Summary: | Checking out books causes an error 500 | ||
---|---|---|---|
Product: | Koha | Reporter: | Jaypee Pinpin <jmpinpin.cca> |
Component: | Circulation | Assignee: | Bugs List <koha-bugs> |
Status: | RESOLVED DUPLICATE | QA Contact: | Testopia <testopia> |
Severity: | enhancement | ||
Priority: | P5 - low | CC: | agastilib, gmcharlt, kyle.m.hall |
Version: | 23.11 | ||
Hardware: | All | ||
OS: | All | ||
Change sponsored?: | --- | Patch complexity: | --- |
Documentation contact: | Documentation submission: | ||
Text to go in the release notes: | Version(s) released in: | ||
Circulation function: | |||
Attachments: |
Error 500 upon check out of book/library material
logs from instance |
Please verify that your item has complete information. It needs: * an itemtype (MARC21 $y) * a homebranch (MARC21 $a) * a holdingbranch (MARC21 $b) If the item is complete, it would help to get the full error from the server logs. I also experienced same problem. all other functions are working fine. While checking out it gives 500 error. (In reply to Katrin Fischer from comment #1) > Please verify that your item has complete information. It needs: > > * an itemtype (MARC21 $y) > * a homebranch (MARC21 $a) > * a holdingbranch (MARC21 $b) > > If the item is complete, it would help to get the full error from the server > logs. Did you check these? I have checked $y, $a and $b item have all information. Also checked log. Problem occurred after upgrade (23.11) Now we are using Koha Offline circulation Firefox plugin to do check out. Renew and Check in is working very well. I have checked $y, $a and $b item have all information. Also checked log. Problem occurred after upgrade (23.11) Now we are using Koha Offline circulation Firefox plugin to do check out. Renew and Check in is working very well. (In reply to Pradeep from comment #5) > I have checked $y, $a and $b item have all information. Also checked log. > Problem occurred after upgrade (23.11) > Now we are using Koha Offline circulation Firefox plugin to do check out. > Renew and Check in is working very well. What did you see in the log? With an error 500 there should be a more helpful error in the logs. You can see what happens during the checkout with tail -f /var/log/koha/<instance>/*.log Log file is so big but I have copied it from Plack.log. I cannot understand which log to check. 10.0.2.2 - - [16/Jan/2024:15:49:33 +0530] "GET /api/v1/app.pl/api/v1/patrons?_page=1&_per_page=10&q=%5B%7B%22-and%22%3A%5B%5B%7B%22me.firstname%22%3A%7B%22like%22%3A%22ghule%25%22%7D%7D%2C%7B%22me.middle_name%22%3A%7B%22like%22%3A%22ghule%25%22%7D%7D%2C%7B%22me.surname%22%3A%7B%22like%22%3A%22ghule%25%22%7D%7D%2C%7B%22me.othernames%22%3A%7B%22like%22%3A%22ghule%25%22%7D%7D%2C%7B%22me.cardnumber%22%3A%7B%22like%22%3A%22ghule%25%22%7D%7D%2C%7B%22me.userid%22%3A%7B%22like%22%3A%22ghule%25%22%7D%7D%5D%2C%5B%7B%22me.firstname%22%3A%7B%22like%22%3A%22pravin%25%22%7D%7D%2C%7B%22me.middle_name%22%3A%7B%22like%22%3A%22pravin%25%22%7D%7D%2C%7B%22me.surname%22%3A%7B%22like%22%3A%22pravin%25%22%7D%7D%2C%7B%22me.othernames%22%3A%7B%22like%22%3A%22pravin%25%22%7D%7D%2C%7B%22me.cardnumber%22%3A%7B%22like%22%3A%22pravin%25%22%7D%7D%2C%7B%22me.userid%22%3A%7B%22like%22%3A%22pravin%25%22%7D%7D%5D%5D%7D%2C%7B%22-or%22%3A%5B%7B%22me.firstname%22%3A%7B%22like%22%3A%22ghule%20pravin%20%25%22%7D%7D%2C%7B%22me.middle_name%22%3A%7B%22like%22%3A%22ghule%20pravin%20%25%22%7D%7D%2C%7B%22me.surname%22%3A%7B%22like%22%3A%22ghule%20pravin%20%25%22%7D%7D%2C%7B%22me.othernames%22%3A%7B%22like%22%3A%22ghule%20pravin%20%25%22%7D%7D%2C%7B%22me.cardnumber%22%3A%7B%22like%22%3A%22ghule%20pravin%20%25%22%7D%7D%2C%7B%22me.userid%22%3A%7B%22like%22%3A%22ghule%20pravin%20%25%22%7D%7D%5D%7D%5D&_order_by=%2Bme.surname%2C%2Bme.firstname HTTP/1.1" 200 - "http://117.217.122.41:9090/cgi-bin/koha/circ/circulation.pl" "Mozilla/5.0 (Windows NT 10.0; Win64; x64) AppleWebKit/537.36 (KHTML, like Gecko) Chrome/120.0.0.0 Safari/537.36" 10.0.2.2 - - [16/Jan/2024:15:49:35 +0530] "GET /api/v1/app.pl/api/v1/patrons?_page=1&_per_page=10&q=%5B%7B%22-and%22%3A%5B%5B%7B%22me.firstname%22%3A%7B%22like%22%3A%22ghule%25%22%7D%7D%2C%7B%22me.middle_name%22%3A%7B%22like%22%3A%22ghule%25%22%7D%7D%2C%7B%22me.surname%22%3A%7B%22like%22%3A%22ghule%25%22%7D%7D%2C%7B%22me.othernames%22%3A%7B%22like%22%3A%22ghule%25%22%7D%7D%2C%7B%22me.cardnumber%22%3A%7B%22like%22%3A%22ghule%25%22%7D%7D%2C%7B%22me.userid%22%3A%7B%22like%22%3A%22ghule%25%22%7D%7D%5D%2C%5B%7B%22me.firstname%22%3A%7B%22like%22%3A%22pravin%25%22%7D%7D%2C%7B%22me.middle_name%22%3A%7B%22like%22%3A%22pravin%25%22%7D%7D%2C%7B%22me.surname%22%3A%7B%22like%22%3A%22pravin%25%22%7D%7D%2C%7B%22me.othernames%22%3A%7B%22like%22%3A%22pravin%25%22%7D%7D%2C%7B%22me.cardnumber%22%3A%7B%22like%22%3A%22pravin%25%22%7D%7D%2C%7B%22me.userid%22%3A%7B%22like%22%3A%22pravin%25%22%7D%7D%5D%2C%5B%7B%22me.firstname%22%3A%7B%22like%22%3A%22ker%25%22%7D%7D%2C%7B%22me.middle_name%22%3A%7B%22like%22%3A%22ker%25%22%7D%7D%2C%7B%22me.surname%22%3A%7B%22like%22%3A%22ker%25%22%7D%7D%2C%7B%22me.othernames%22%3A%7B%22like%22%3A%22ker%25%22%7D%7D%2C%7B%22me.cardnumber%22%3A%7B%22like%22%3A%22ker%25%22%7D%7D%2C%7B%22me.userid%22%3A%7B%22like%22%3A%22ker%25%22%7D%7D%5D%5D%7D%2C%7B%22-or%22%3A%5B%7B%22me.firstname%22%3A%7B%22like%22%3A%22ghule%20pravin%20ker%25%22%7D%7D%2C%7B%22me.middle_name%22%3A%7B%22like%22%3A%22ghule%20pravin%20ker%25%22%7D%7D%2C%7B%22me.surname%22%3A%7B%22like%22%3A%22ghule%20pravin%20ker%25%22%7D%7D%2C%7B%22me.othernames%22%3A%7B%22like%22%3A%22ghule%20pravin%20ker%25%22%7D%7D%2C%7B%22me.cardnumber%22%3A%7B%22like%22%3A%22ghule%20pravin%20ker%25%22%7D%7D%2C%7B%22me.userid%22%3A%7B%22like%22%3A%22ghule%20pravin%20ker%25%22%7D%7D%5D%7D%5D&_order_by=%2Bme.surname%2C%2Bme.firstname HTTP/1.1" 200 - "http://117.217.122.41:9090/cgi-bin/koha/circ/circulation.pl" "Mozilla/5.0 (Windows NT 10.0; Win64; x64) AppleWebKit/537.36 (KHTML, like Gecko) Chrome/120.0.0.0 Safari/537.36" 10.0.2.2 - - [16/Jan/2024:15:49:38 +0530] "GET /intranet/circ/circulation.pl?borrowernumber=2 HTTP/1.1" 200 1780413 "http://117.217.122.41:9090/cgi-bin/koha/circ/circulation.pl" "Mozilla/5.0 (Windows NT 10.0; Win64; x64) AppleWebKit/537.36 (KHTML, like Gecko) Chrome/120.0.0.0 Safari/537.36" 10.0.2.2 - - [16/Jan/2024:15:49:38 +0530] "GET /intranet/members/patronimage.pl?borrowernumber=2 HTTP/1.1" 200 37175 "http://117.217.122.41:9090/cgi-bin/koha/circ/circulation.pl?borrowernumber=2" "Mozilla/5.0 (Windows NT 10.0; Win64; x64) AppleWebKit/537.36 (KHTML, like Gecko) Chrome/120.0.0.0 Safari/537.36" 10.0.2.2 - - [16/Jan/2024:15:49:42 +0530] "GET /opac/opac-detail.pl?biblionumber=54915 HTTP/1.1" 200 1741066 "-" "Mozilla/5.0 AppleWebKit/537.36 (KHTML, like Gecko; compatible; bingbot/2.0; +http://www.bing.com/bingbot.htm) Chrome/116.0.1938.76 Safari/537.36" 10.0.2.2 - - [16/Jan/2024:15:49:43 +0530] "GET errors/500.pl HTTP/1.1" 500 1657645 "http://117.217.122.41:9090/cgi-bin/koha/circ/circulation.pl?borrowernumber=2" "Mozilla/5.0 (Windows NT 10.0; Win64; x64) AppleWebKit/537.36 (KHTML, like Gecko) Chrome/120.0.0.0 Safari/537.36" Created attachment 161057 [details]
logs from instance
This is from various logs.
(In reply to Katrin Fischer from comment #6) > (In reply to Pradeep from comment #5) > > I have checked $y, $a and $b item have all information. Also checked log. > > Problem occurred after upgrade (23.11) > > Now we are using Koha Offline circulation Firefox plugin to do check out. > > Renew and Check in is working very well. > > What did you see in the log? With an error 500 there should be a more > helpful error in the logs. > You can see what happens during the checkout with tail -f > /var/log/koha/<instance>/*.log Please ignore earlier reply. Following are the results of tail -f /var/log/koha/library/*.log command while checking out book. library@AgastiKohaTest:~$ tail -f /var/log/koha/library/*.log ==> /var/log/koha/library/api-error.log <== ==> /var/log/koha/library/indexer-error.log <== 20240109 00:55:46 library-koha-indexer: client (pid 1288) killed by signal 15, stopping 20240109 09:10:38 library-koha-indexer: client (pid 1345) killed by signal 15, stopping 20240109 10:17:30 library-koha-indexer: client (pid 1436) killed by signal 15, stopping 20240109 10:31:13 library-koha-indexer: client (pid 1191) killed by signal 15, stopping 20240109 14:11:36 library-koha-indexer: client (pid 1054) killed by signal 15, stopping 20240109 14:58:01 library-koha-indexer: client (pid 1022) killed by signal 15, stopping 20240110 16:13:39 library-koha-indexer: client (pid 1150) killed by signal 15, stopping 20240113 13:37:08 library-koha-indexer: client (pid 1363) killed by signal 15, stopping 20240116 15:37:47 library-koha-indexer: client (pid 1256) killed by signal 15, stopping 20240117 13:53:31 library-koha-indexer: client (pid 1342) killed by signal 15, stopping ==> /var/log/koha/library/indexer-output.log <== Warning: script running in daemon mode, without recommended caching system (memcached). DBIx::Class::Storage::DBI::catch {...} (): DBI Connection failed: DBI connect('database=koha_library;host=localhost;port=3306','koha_library',...) failed: Can't connect to local MySQL server through socket '/run/mysqld/mysqld.sock' (2) at /usr/share/koha/lib/Koha/Database.pm line 91. at /usr/share/koha/lib/Koha/Database.pm line 139 Connection to the memcached servers '127.0.0.1:11211' failed. Are the unix socket permissions set properly? Is the host reachable? If you ignore this warning, you will face performance issues Connection to the memcached servers '127.0.0.1:11211' failed. Are the unix socket permissions set properly? Is the host reachable? If you ignore this warning, you will face performance issues Warning: script running in daemon mode, without recommended caching system (memcached). DBIx::Class::Storage::DBI::catch {...} (): DBI Connection failed: DBI connect('database=koha_library;host=localhost;port=3306','koha_library',...) failed: Can't connect to local MySQL server through socket '/run/mysqld/mysqld.sock' (2) at /usr/share/koha/lib/Koha/Database.pm line 91. at /usr/share/koha/lib/Koha/Database.pm line 139 ==> /var/log/koha/library/intranet-error.log <== [Wed Jan 17 10:59:25.609413 2024] [proxy:warn] [pid 81883] [client 10.0.2.2:51316] AH01092: no HTTP 0.9 request (with no host line) on incoming request and preserve host set forcing hostname to be library-intra.myDNSname.org for uri /cgi-bin/koha/errors/400.pl [Wed Jan 17 10:59:25.609485 2024] [proxy:error] [pid 81883] (70014)End of file found: [client 10.0.2.2:51316] AH01095: prefetch request body failed to 0.0.0.0:0 (httpd-UDS) from 10.0.2.2 () [Wed Jan 17 10:59:25.624587 2024] [proxy:warn] [pid 81884] [client 10.0.2.2:51317] AH01092: no HTTP 0.9 request (with no host line) on incoming request and preserve host set forcing hostname to be library-intra.myDNSname.org for uri /cgi-bin/koha/errors/400.pl [Wed Jan 17 10:59:25.624645 2024] [proxy:error] [pid 81884] (70014)End of file found: [client 10.0.2.2:51317] AH01095: prefetch request body failed to 0.0.0.0:0 (httpd-UDS) from 10.0.2.2 () [Wed Jan 17 13:08:27.100595 2024] [proxy:warn] [pid 91004] [client 10.0.2.2:48048] AH01092: no HTTP 0.9 request (with no host line) on incoming request and preserve host set forcing hostname to be library-intra.myDNSname.org for uri /cgi-bin/koha/errors/400.pl [Wed Jan 17 13:08:27.100667 2024] [proxy:error] [pid 91004] (70014)End of file found: [client 10.0.2.2:48048] AH01095: prefetch request body failed to 0.0.0.0:0 (httpd-UDS) from 10.0.2.2 () [Wed Jan 17 13:08:42.807839 2024] [proxy:warn] [pid 91020] [client 10.0.2.2:39694] AH01092: no HTTP 0.9 request (with no host line) on incoming request and preserve host set forcing hostname to be library-intra.myDNSname.org for uri /cgi-bin/koha/errors/400.pl [Wed Jan 17 13:08:42.807894 2024] [proxy:error] [pid 91020] (70014)End of file found: [client 10.0.2.2:39694] AH01095: prefetch request body failed to 0.0.0.0:0 (httpd-UDS) from 10.0.2.2 () [Wed Jan 17 13:08:52.742987 2024] [proxy:warn] [pid 91029] [client 10.0.2.2:48936] AH01092: no HTTP 0.9 request (with no host line) on incoming request and preserve host set forcing hostname to be library-intra.myDNSname.org for uri /cgi-bin/koha/errors/400.pl [Wed Jan 17 13:08:52.743037 2024] [proxy:error] [pid 91029] (70014)End of file found: [client 10.0.2.2:48936] AH01095: prefetch request body failed to 0.0.0.0:0 (httpd-UDS) from 10.0.2.2 () ==> /var/log/koha/library/opac-error.log <== [Wed Jan 17 10:39:21.370475 2024] [proxy:warn] [pid 80510] [client 10.0.2.2:65501] AH01092: no HTTP 0.9 request (with no host line) on incoming request and preserve host set forcing hostname to be library.myDNSname.org for uri /cgi-bin/koha/errors/400.pl [Wed Jan 17 10:39:21.370541 2024] [proxy:error] [pid 80510] (70014)End of file found: [client 10.0.2.2:65501] AH01095: prefetch request body failed to 0.0.0.0:0 (httpd-UDS) from 10.0.2.2 () [Wed Jan 17 10:39:21.472670 2024] [proxy:warn] [pid 80511] [client 10.0.2.2:65502] AH01092: no HTTP 0.9 request (with no host line) on incoming request and preserve host set forcing hostname to be library.myDNSname.org for uri /cgi-bin/koha/errors/400.pl [Wed Jan 17 10:39:21.472737 2024] [proxy:error] [pid 80511] (70014)End of file found: [client 10.0.2.2:65502] AH01095: prefetch request body failed to 0.0.0.0:0 (httpd-UDS) from 10.0.2.2 () [Wed Jan 17 10:39:21.572230 2024] [proxy:warn] [pid 80512] [client 10.0.2.2:65503] AH01092: no HTTP 0.9 request (with no host line) on incoming request and preserve host set forcing hostname to be library.myDNSname.org for uri /cgi-bin/koha/errors/400.pl [Wed Jan 17 10:39:21.572281 2024] [proxy:error] [pid 80512] (70014)End of file found: [client 10.0.2.2:65503] AH01095: prefetch request body failed to 0.0.0.0:0 (httpd-UDS) from 10.0.2.2 () [Wed Jan 17 10:39:21.672859 2024] [php7:error] [pid 80513] [client 10.0.2.2:65504] script '/usr/share/koha/opac/htdocs/wp-login.php' not found or unable to stat [Wed Jan 17 10:39:22.656233 2024] [php7:error] [pid 80517] [client 10.0.2.2:65508] script '/usr/share/koha/opac/htdocs/xmlrpc.php' not found or unable to stat [Wed Jan 17 12:13:30.951088 2024] [proxy:warn] [pid 87163] [client 10.0.2.2:16133] AH01092: no HTTP 0.9 request (with no host line) on incoming request and preserve host set forcing hostname to be library.myDNSname.org for uri /cgi-bin/koha/errors/400.pl [Wed Jan 17 12:13:30.951159 2024] [proxy:error] [pid 87163] (70014)End of file found: [client 10.0.2.2:16133] AH01095: prefetch request body failed to 0.0.0.0:0 (httpd-UDS) from 10.0.2.2 () ==> /var/log/koha/library/plack-api-error.log <== [2023/09/11 13:12:15] [WARN] Warning: Failed to fetch oauth configuration: DBIx::Class::Storage::DBI::catch {...} (): DBI Connection failed: DBI connect('database=koha_library;host=localhost;port=3306','koha_library',...) failed: Can't connect to local MySQL server through socket '/run/mysqld/mysqld.sock' (2) at /usr/share/koha/lib/Koha/Database.pm line 91. at /usr/share/koha/lib/Koha/Database.pm line 139 [2023/09/11 13:12:16] [WARN] Warning: Failed to fetch oauth configuration: DBIx::Class::Storage::DBI::catch {...} (): DBI Connection failed: DBI connect('database=koha_library;host=localhost;port=3306','koha_library',...) failed: Can't connect to local MySQL server through socket '/run/mysqld/mysqld.sock' (2) at /usr/share/koha/lib/Koha/Database.pm line 91. at /usr/share/koha/lib/Koha/Database.pm line 139 ==> /var/log/koha/library/plack-error.log <== 2024/01/17-13:53:30 Received QUIT. Running a graceful shutdown Sending children hup signal 2024/01/17-13:53:31 Worker processes cleaned up 2024/01/17-13:53:31 Server closing! Process Backgrounded 2024/01/17-13:53:44 Starman::Server (type Net::Server::PreFork) starting! pid(893) Binding to UNIX socket file "/var/run/koha/library/plack.sock" Setting gid to "1001 1001" Setting uid to "1001" DBIx::Class::Storage::DBI::_dbh_execute(): DBI Exception: DBD::mysql::st execute failed: Unknown column 'me.booking_id' in 'field list' at /usr/share/koha/lib/Koha/Objects.pm line 317 ==> /var/log/koha/library/plack-intranet-error.log <== [2024/01/17 10:14:06] [WARN] DBIx::Class::ResultSetColumn::new(): Attempting to retrieve non-unique column 'biblionumber' on a resultset containing one-to-many joins will return duplicate results. at /usr/share/koha/lib/Koha/Objects.pm line 426 [2024/01/17 10:14:06] [WARN] DBIx::Class::ResultSet::_construct_results(): Unable to properly collapse has_many results in iterator mode due to order criteria - performed an eager cursor slurp underneath. Consider using ->all() instead at /usr/share/koha/lib/Koha/Objects.pm line 317 [2024/01/17 10:15:36] [WARN] DBIx::Class::ResultSetColumn::new(): Attempting to retrieve non-unique column 'biblionumber' on a resultset containing one-to-many joins will return duplicate results. at /usr/share/koha/lib/Koha/Objects.pm line 426 [2024/01/17 10:59:45] [WARN] An appropriate email address for borrower pardhirahulshivajicould not be found. at /usr/share/koha/lib/C4/Message.pm line 194. [2024/01/17 12:29:55] [WARN] Use of uninitialized value in addition (+) at /usr/share/koha/lib/C4/Biblio.pm line 3051. [2024/01/17 12:30:05] [WARN] Use of uninitialized value in addition (+) at /usr/share/koha/lib/C4/Biblio.pm line 3051. [2024/01/17 12:30:05] [WARN] Use of uninitialized value in addition (+) at /usr/share/koha/lib/C4/Biblio.pm line 3051. [2024/01/17 12:30:08] [WARN] Use of uninitialized value in addition (+) at /usr/share/koha/lib/C4/Biblio.pm line 3051. [2024/01/17 12:30:10] [WARN] An appropriate email address for borrower dhongaderohinidhawlacould not be found. at /usr/share/koha/lib/C4/Message.pm line 194. [2024/01/17 12:30:12] [WARN] Use of uninitialized value in addition (+) at /usr/share/koha/lib/C4/Biblio.pm line 3051. ==> /var/log/koha/library/plack.log <== 10.0.2.2 - - [17/Jan/2024:13:57:54 +0530] "GET /opac/opac-search.pl?q=su:%22nanoporous%20silicon%22 HTTP/1.1" 200 2072258 "http://lib.agasticollege.in:9000/cgi-bin/koha/opac-search.pl?q=su%3A%22antitumoral%20microRNA%20miRNA%22" "Mozilla/5.0 (Linux; Android 7.0;) AppleWebKit/537.36 (KHTML, like Gecko) Mobile Safari/537.36 (compatible; PetalBot;+https://webmaster.petalsearch.com/site/petalbot)" 10.0.2.2 - - [17/Jan/2024:13:57:57 +0530] "GET /intranet/mainpage.pl HTTP/1.1" 200 1447702 "http://192.168.1.45:9090/cgi-bin/koha/circ/circulation.pl" "Mozilla/5.0 (Windows NT 10.0; Win64; x64) AppleWebKit/537.36 (KHTML, like Gecko) Chrome/120.0.0.0 Safari/537.36" 10.0.2.2 - - [17/Jan/2024:13:57:59 +0530] "GET /intranet/mainpage.pl HTTP/1.1" 200 1439965 "http://192.168.1.45:9090/cgi-bin/koha/mainpage.pl" "Mozilla/5.0 (Windows NT 10.0; Win64; x64) AppleWebKit/537.36 (KHTML, like Gecko) Chrome/120.0.0.0 Safari/537.36" 10.0.2.2 - - [17/Jan/2024:13:58:00 +0530] "GET /opac/opac-detail.pl?biblionumber=62675 HTTP/1.1" 200 1507605 "-" "Mozilla/5.0 AppleWebKit/537.36 (KHTML, like Gecko; compatible; bingbot/2.0; +http://www.bing.com/bingbot.htm) Chrome/116.0.1938.76 Safari/537.36" 10.0.2.2 - - [17/Jan/2024:13:58:01 +0530] "GET /intranet/mainpage.pl HTTP/1.1" 200 1676277 "http://192.168.1.45:9090/cgi-bin/koha/mainpage.pl" "Mozilla/5.0 (Windows NT 10.0; Win64; x64) AppleWebKit/537.36 (KHTML, like Gecko) Chrome/120.0.0.0 Safari/537.36" 10.0.2.2 - - [17/Jan/2024:13:58:33 +0530] "GET /opac/opac-search.pl?q=su:%22Anti-Semitism%22 HTTP/1.1" 200 2158805 "-" "Mozilla/5.0 AppleWebKit/537.36 (KHTML, like Gecko; compatible; bingbot/2.0; +http://www.bing.com/bingbot.htm) Chrome/116.0.1938.76 Safari/537.36" 10.0.2.2 - - [17/Jan/2024:13:58:36 +0530] "GET /opac/opac-detail.pl?biblionumber=61248 HTTP/1.1" 200 1488573 "-" "Mozilla/5.0 AppleWebKit/537.36 (KHTML, like Gecko; compatible; bingbot/2.0; +http://www.bing.com/bingbot.htm) Chrome/116.0.1938.76 Safari/537.36" 10.0.2.2 - - [17/Jan/2024:13:58:38 +0530] "GET /opac/opac-detail.pl?biblionumber=33791 HTTP/1.1" 200 1917637 "-" "Mozilla/5.0 AppleWebKit/537.36 (KHTML, like Gecko; compatible; bingbot/2.0; +http://www.bing.com/bingbot.htm) Chrome/116.0.1938.76 Safari/537.36" 10.0.2.2 - - [17/Jan/2024:13:58:40 +0530] "GET /opac/opac-detail.pl?biblionumber=77394 HTTP/1.1" 200 1746786 "-" "Mozilla/5.0 AppleWebKit/537.36 (KHTML, like Gecko; compatible; bingbot/2.0; +http://www.bing.com/bingbot.htm) Chrome/116.0.1938.76 Safari/537.36" 10.0.2.2 - - [17/Jan/2024:13:58:40 +0530] "GET /intranet/mainpage.pl HTTP/1.1" 200 1447188 "http://192.168.1.45:9090/cgi-bin/koha/mainpage.pl" "Mozilla/5.0 (Windows NT 10.0; Win64; x64) AppleWebKit/537.36 (KHTML, like Gecko) Chrome/120.0.0.0 Safari/537.36" ==> /var/log/koha/library/plack-opac-error.log <== [2024/01/17 08:00:29] [WARN] Use of uninitialized value $subfieldvalue in concatenation (.) or string at /usr/share/koha/lib/C4/Biblio.pm line 950. [2024/01/17 08:20:39] [WARN] Argument "\x{968}\x{966}\x{968}\x{966}" isn't numeric in numeric gt (>) at /usr/share/koha/lib/C4/Biblio.pm line 2406. [2024/01/17 08:20:40] [WARN] Argument "\x{968}\x{966}\x{968}\x{966}" isn't numeric in numeric gt (>) at /usr/share/koha/lib/C4/Biblio.pm line 2406. [2024/01/17 08:51:09] [WARN] Use of uninitialized value $hits in numeric eq (==) at /usr/share/koha/opac/cgi-bin/opac/opac-search.pl line 612. [2024/01/17 08:51:11] [WARN] Use of uninitialized value $times in subtraction (-) at /usr/share/koha/lib/C4/Search.pm line 1714. [2024/01/17 10:27:29] [WARN] Use of uninitialized value $hits in numeric eq (==) at /usr/share/koha/opac/cgi-bin/opac/opac-search.pl line 612. [2024/01/17 10:27:29] [WARN] Use of uninitialized value $times in subtraction (-) at /usr/share/koha/lib/C4/Search.pm line 1714. [2024/01/17 13:53:30] [WARN] No method count found for Koha::Libraries DBIx::Class::Storage::DBI::catch {...} (): DBI Connection failed: DBI connect('database=koha_library;host=localhost;port=3306','koha_library',...) failed: Can't connect to local MySQL server through socket '/run/mysqld/mysqld.sock' (2) at /usr/share/koha/lib/Koha/Database.pm line 91. at /usr/share/koha/lib/Koha/Objects.pm line 583 at /usr/share/koha/lib/C4/Auth.pm line 472. [2024/01/17 13:53:30] [WARN] Use of uninitialized value in numeric eq (==) at /usr/share/koha/lib/C4/Auth.pm line 472. ==> /var/log/koha/library/sip.log <== ==> /var/log/koha/library/worker-error.log <== 20240109 14:58:01 library-koha-worker-long_tasks: client (pid 907) killed by signal 15, stopping 20240110 16:09:13 library-koha-worker-long_tasks: client (pid 1102) exited with 2 status, respawning 20240110 16:13:39 library-koha-worker: client (pid 1030) killed by signal 15, stopping 20240110 16:13:39 library-koha-worker-long_tasks: client (pid 116144) killed by signal 15, stopping 20240113 13:37:08 library-koha-worker: client (pid 1160) killed by signal 15, stopping 20240113 13:37:08 library-koha-worker-long_tasks: client (pid 1220) killed by signal 15, stopping 20240116 15:37:47 library-koha-worker: client (pid 1127) killed by signal 15, stopping 20240116 15:37:47 library-koha-worker-long_tasks: client (pid 1216) killed by signal 15, stopping 20240117 13:53:31 library-koha-worker: client (pid 1181) killed by signal 15, stopping 20240117 13:53:31 library-koha-worker-long_tasks: client (pid 1269) killed by signal 15, stopping ==> /var/log/koha/library/worker-output.log <== Cannot connect to the message broker, the jobs will be processed anyway (Failed to connect: Error connecting to localhost:61613: Connection refused at /usr/share/perl5/Net/Stomp.pm line 27.; giving up at /usr/share/perl5/Net/Stomp.pm line 27. ) at /usr/share/koha/bin/workers/background_jobs_worker.pl line 92. Cannot connect to the message broker, the jobs will be processed anyway (Failed to connect: Error connecting to localhost:61613: Connection refused at /usr/share/perl5/Net/Stomp.pm line 27.; giving up at /usr/share/perl5/Net/Stomp.pm line 27. ) at /usr/share/koha/bin/workers/background_jobs_worker.pl line 92. Cannot connect to the message broker, the jobs will be processed anyway (Failed to connect: Error connecting to localhost:61613: Connection refused at /usr/share/perl5/Net/Stomp.pm line 27.; giving up at /usr/share/perl5/Net/Stomp.pm line 27. ) at /usr/share/koha/bin/workers/background_jobs_worker.pl line 92. Cannot connect to the message broker, the jobs will be processed anyway (Failed to connect: Error connecting to localhost:61613: Connection refused at /usr/share/perl5/Net/Stomp.pm line 27.; giving up at /usr/share/perl5/Net/Stomp.pm line 27. ) at /usr/share/koha/bin/workers/background_jobs_worker.pl line 92. Cannot connect to the message broker, the jobs will be processed anyway (Failed to connect: Error connecting to localhost:61613: Connection refused at /usr/share/perl5/Net/Stomp.pm line 27.; giving up at /usr/share/perl5/Net/Stomp.pm line 27. ) at /usr/share/koha/bin/workers/background_jobs_worker.pl line 92. ==> /var/log/koha/library/z3950-error.log <== ==> /var/log/koha/library/zebra-error.log <== ==> /var/log/koha/library/zebra-output.log <== ==> /var/log/koha/library/plack.log <== 10.0.2.2 - - [17/Jan/2024:13:58:52 +0530] "POST /intranet/circ/circulation.pl HTTP/1.1" 200 1518266 "http://192.168.1.45:9090/cgi-bin/koha/mainpage.pl" "Mozilla/5.0 (Windows NT 10.0; Win64; x64) AppleWebKit/537.36 (KHTML, like Gecko) Chrome/120.0.0.0 Safari/537.36" 10.0.2.2 - - [17/Jan/2024:13:58:52 +0530] "GET /intranet/members/patronimage.pl?borrowernumber=4033 HTTP/1.1" 200 34312 "http://192.168.1.45:9090/cgi-bin/koha/circ/circulation.pl" "Mozilla/5.0 (Windows NT 10.0; Win64; x64) AppleWebKit/537.36 (KHTML, like Gecko) Chrome/120.0.0.0 Safari/537.36" ==> /var/log/koha/library/plack-error.log <== DBIx::Class::Storage::DBI::_dbh_execute(): DBI Exception: DBD::mysql::st execute failed: Unknown column 'me.booking_id' in 'field list' at /usr/share/koha/lib/Koha/Objects.pm line 317 ==> /var/log/koha/library/plack.log <== 10.0.2.2 - - [17/Jan/2024:13:58:55 +0530] "GET errors/500.pl HTTP/1.1" 500 1412713 "http://192.168.1.45:9090/cgi-bin/koha/circ/circulation.pl" "Mozilla/5.0 (Windows NT 10.0; Win64; x64) AppleWebKit/537.36 (KHTML, like Gecko) Chrome/120.0.0.0 Safari/537.36" 10.0.2.2 - - [17/Jan/2024:13:59:02 +0530] "GET /opac/opac-detail.pl?biblionumber=38710 HTTP/1.1" 200 1749897 "-" "Mozilla/5.0 AppleWebKit/537.36 (KHTML, like Gecko; compatible; bingbot/2.0; +http://www.bing.com/bingbot.htm) Chrome/116.0.1938.76 Safari/537.36" There is definitely some stuff there that doesn't look great. This here is something we coudl start with: ==> /var/log/koha/library/plack-error.log <== DBIx::Class::Storage::DBI::_dbh_execute(): DBI Exception: DBD::mysql::st execute failed: Unknown column 'me.booking_id' in 'field list' at /usr/share/koha/lib/Koha/Objects.pm line 317 Do you have the room reservation plugin installed or had it in stalled? Please check if you have a table bookings with a column booking_id. (In reply to Katrin Fischer from comment #10) > There is definitely some stuff there that doesn't look great. > > This here is something we coudl start with: > ==> /var/log/koha/library/plack-error.log <== > DBIx::Class::Storage::DBI::_dbh_execute(): DBI Exception: DBD::mysql::st > execute failed: Unknown column 'me.booking_id' in 'field list' at > /usr/share/koha/lib/Koha/Objects.pm line 317 > > Do you have the room reservation plugin installed or had it in stalled? > > Please check if you have a table bookings with a column booking_id. Yes, I had installed room reservation plugin and later deleted it after testing. I have cleared data from bookings table and also deleted booking table, room reservation table but both attempts failed to solve error 500. This is the problem you are seeing: Bug 35473 - Core bookings and room reservations plugin tables clash We added a bookings table to Koha not aware that the plugin didn't follow naming conventions and already added a table of the same name. My guess is that you need to rerun the database update manually (the SQL from it) that would create the table Koha expects: installer/data/mysql/db_revs/230600061.pl *** This bug has been marked as a duplicate of bug 35473 *** |
Created attachment 160509 [details] Error 500 upon check out of book/library material KOHA VER. 23.11.00 - January update Checkingout books causes a error 500, pressing the "Check out" botton with a blank barcode causes to redirect to print issuequick slip. I tested this on our system, and replicated the same issue on KOHA Demo website.