Ошибка при работе агента

[ilyang]

Доброго времени!
Обновил OTRS с 3.0.хх до 3.1.6 на FreeBSD 8.3, обновление прошло успешно, за исключением одной ПРОБЛЕМЫ

Периодически в агентском интерфейсе не отображается страница (отображается после 3-10 кратного обновления страницы), и на каждое обновление в логе одна и та же запись:

Код: Выделить всё

[Thu Aug  9 11:37:28 2012] -e: print() on closed filehandle LOG at /usr/local/otrs//Kernel/Output/HTML/Layout.pm line 1670.
[Thu Aug  9 11:37:30 2012] -e: print() on closed filehandle LOG at /usr/local/otrs//Kernel/Output/HTML/Layout.pm line 1670.
[Thu Aug  9 11:37:31 2012] -e: print() on closed filehandle LOG at /usr/local/otrs//Kernel/Output/HTML/Layout.pm line 1670.

Системы при возникновении ошибки не вижу, по моим наблюдениям ошибка возникает рандомно.
Подскажите как решить или хотя бы куда копать?

[ilyang]

Проверил установленные CPAN-модули, вроде все правильно. Что бы еще проверить, а?

Код: Выделить всё

# ./bin/otrs.CheckModules.pl
   o CGI..............................ok (v3.43)
   o Crypt::PasswdMD5.................ok (v1.3)
   o Crypt::SSLeay....................ok (v0.64)
   o CSS::Minifier::XS................ok (v0.08)
   o Date::Format.....................ok (v2.24)
   o Date::Pcalc......................ok (v6.1)
   o DBI..............................ok (v1.622)
   o DBD::mysql.......................ok (v4.021)
   o DBD::ODBC........................Not installed! (Optional - Required to connect to a MS-SQL database.)
   o DBD::Oracle......................Not installed! (Optional - Required to connect to a Oracle database.)
   o DBD::Pg..........................Not installed! (Optional - Required to connect to a PostgreSQL database.)
   o Digest::MD5......................ok (v2.39)
   o Digest::SHA......................ok (v5.71)
   o Digest::SHA......................ok (v5.71)
   o Encode::HanExtra.................Not installed! (Optional - Required to handle mails with several Chinese character sets.)
   o Encode::Locale...................ok (v1.03)
   o GD...............................ok (v2.46)
      o GD::Text......................ok (v0.86)
      o GD::Graph.....................ok (v1.44_01)
      o GD::Graph::lines..............ok (v1.17)
      o GD::Text::Align...............ok (v1.18)
   o IO::Scalar.......................ok (v2.110)
   o IO::Wrap.........................ok (v2.110)
   o JavaScript::Minifier::XS.........ok (v0.09)
   o JSON.............................ok (v2.53)
      o JSON::PP......................ok (v2.27200)
      o JSON::XS......................ok (v2.33)
   o Locale::Codes....................ok (v3.17)
   o LWP::UserAgent...................ok (v6.04)
   o Mail::Internet...................ok (v2.09)
   o Mail::POP3Client.................ok (v2.18 )
      o IO::Socket::SSL...............ok (v1.76)
   o Mail::IMAPClient.................ok (v3.31)
      o IO::Socket::SSL...............ok (v1.76)
   o MIME::Base64.....................ok (v3.13)
   o MIME::Tools......................ok (v5.503)
   o ModPerl::Util....................ok (v2.000007)
      o Apache::DBI...................ok (v1.11)
      o Apache2::Reload...............ok (v0.12)
   o Net::DNS.........................ok (v0.68)
   o Net::POP3........................ok (v2.29)
   o Net::IMAP::Simple................ok (v1.2030)
      o Net::IMAP::Simple::SSL........ok (v1.3)
   o Net::SMTP........................ok (v2.31)
      o Authen::SASL..................ok (v2.15)
      o Net::SMTP::SSL................ok (v1.01)
      o Net::SMTP::TLS::ButMaintained.Not installed! (Optional - Required for TLS/SMTP connections.)
   o Net::LDAP........................ok (v0.44)
   o Net::SSL.........................ok (v2.85)
   o PDF::API2........................ok (v2.019)
      o Compress::Zlib................ok (v2.055)
   o SOAP::Lite.......................ok (v0.715)
      o version.......................ok (v0.99)
      o Class::Inspector..............ok (v1.27)
   o Text::CSV........................ok (v1.21)
      o Text::CSV_PP..................ok (v1.29)
      o Text::CSV_XS..................ok (v0.90)
   o XML::Parser......................ok (v2.41)
   o HTTP::Message....................ok (v6.03)
      o HTTP::Headers.................ok (v6.00)
   o URI..............................ok (v1.60)
      o URI::Escape...................ok (v3.31)
   o Scalar::Util.....................ok (v1.25)

[ilyang]

Тихо сам с собою я веду беседу.. Похоже, виновник проблем он

Код: Выделить всё

     o Apache2::Reload...............ok (v0.12)

Почему не понятно, может выясню, а пока отключил и ни одного сбоя.
В манах прописано что при этом пропадает возможность ставить пакеты из вебморды.. Не очень то и хотелось! Поставлю через opm

[alexus]

Странная ошибка. Мы проводили опыты по миграции с 3.0 на 3.1 и таких проблем не было.

[ilyang]

Сегодня пришли остальные агенты и проблема вернулась, рано радовался. Apache2::Reload не виновен
У кого есть идеи почему он в закрытый лог писать пытается?

Код: Выделить всё

[Fri Aug 10 10:18:30 2012] -e: print() on closed filehandle LOG at /usr/local/otrs//Kernel/Output/HTML/Layout.pm line 1670.
[Fri Aug 10 10:18:30 2012] -e: print() on closed filehandle LOG at /usr/local/otrs//Kernel/Output/HTML/Layout.pm line 1670.
[Fri Aug 10 10:18:31 2012] -e: print() on closed filehandle LOG at /usr/local/otrs//Kernel/Output/HTML/Layout.pm line 1670.

[raxru]

Аналогичная проблема, ссылается только на другую строчку кода.

Код: Выделить всё

[Wed May 22 10:29:08 2013] -e: print() on closed filehandle LOG at /usr/local/otrs//Kernel/Output/HTML/Layout.pm line 1643.

FreeBSD 8.3-RELEASE, perl-5.14

[merkushov]

Может быть дело в ротации логов?!

[raxru]

Сомневаюсь. Проблема проявляется гораздо чаще, чем ротируются логи.

[alexus]

Надо смотреть лог апача, который дает более подробную трассировку. И лог messages тоже можно глянуть.

[raxru]

А это из лога апача

Код: Выделить всё

[Thu May 23 09:53:15 2013] -e: print() on closed filehandle LOG at /usr/local/otrs//Kernel/Output/HTML/Layout.pm line 1643.

А в messages эта проблема никак отображается.

[raxru]

Надеюсь, что победил:
в файле - /usr/local/etc/apache22/Includes/otrs.conf закометировал все, что связано с mod_perl.

Код: Выделить всё

#<IfModule mod_perl.c>
#
#    # load all otrs modules
#    Perlrequire /usr/local/otrs/scripts/apache2-perl-startup.pl
#
#    # Apache::Reload - Reload Perl Modules when Changed on Disk
#    PerlModule Apache2::Reload
#    PerlInitHandler Apache2::Reload
#    PerlModule Apache2::RequestRec
...
#        Allow from all
#    </Location>
#
#    # set mod_perl2 option for generic interface
#    <Location /otrs/nph-genericinterface.pl>
#        PerlOptions -ParseHeaders
#    </Location>
#
#</IfModule>

[alexus26]

Надеюсь, что победил:
в файле - /usr/local/etc/apache22/Includes/otrs.conf закометировал все, что связано с mod_perl.

Думаю, теперь будут небольшие тормоза в работе интерфейса, так как модуль mod_perl рекомендован системой OTRS для ускорения работы Apache.

[raxru]

Думаю, теперь будут небольшие тормоза в работе интерфейса, так как модуль mod_perl рекомендован системой OTRS для ускорения работы Apache.

Тормозов не заметили, может быть по причине небольшого кол-ва агентов, но в системе стало намного комфортней работать.

[alexus26]

Тормозов не заметили, может быть по причине небольшого кол-ва агентов, но в системе стало намного комфортней работать.

Хм, у меня наблюдалась иная ситуация. После активации mod_perl интерфейс стал шустрее, при оформлении новой заявки после выбора очереди практически моментально подгружается список агентов этой очереди. А без модуля все было уныло и медленно.

[TitovLab]

Столкнулся с похожей ошибкой. Иногда OTRS предлагала скачать index.pl, вместо отображения интерфейса в браузере. В этот момент в логах Apache была запись:
-e: print() on closed filehandle LOG at /opt/otrs//Kernel/Output/HTML/Layout.pm line 1445 (и не только Layout.pm)
В ходе отладки всему виной оказалась система инвентаризации OCS Inventory, которая работала по соседству на этом же веб-сервере Apache. Нашел упоминания на форумах OTRS о данном баге от 2010 года. К сожалению, там рекомендовали такое же решение - отключить mod_perl и получить проблемы с производительностью.
Мне удалось решить проблему редактированием файла /usr/share/perl5/vendor_perl/Apache/Ocsinventory/Server/System.pm, а именно закомментировать две строки:
# select(LOG);
# $|=1;
На сколько я понял OCS закрывал лог-файл OTRS, когда так пыталась сделать запись в него
Самое интересное, просмотрел весь код OCS и так и не нашел причин, зачем они так жестко поставили эту конструкцию, т.к. закомментировав обе эти строки никакой функционал у OCS не нарушился, а OTRS заработала.
После правки на всякий случай перезапустил Apache.
На всякий случай отправил на баг-репорт: http://bugs.otrs.org/show_bug.cgi?id=5338