I am experiencing a problem when indexing all my documents using
FullTextSession fullTextSession = Search.getFullTextSession(session);
fullTextSession.createIndexer().startAndWait();
The problem does not occur in the dev environment with what we understand to be the same data in the database.
There is a lot of different errors here but have tried investigated all without coming to a solution.
I have shown the full stacktrace of all the errors just in case but I am sure some of would be irrelevant
Any tips/thoughts/angles to investigate would be helpful.
Let me know if you require further information
Thanks
Vishal
Using:
Hibernate 3.6.10
Hibernate Search 3.4.1
Code:
08:47:04,823 INFO [STDOUT] 08:47:04,822 INFO SimpleIndexingProgressMonitor:97 - 99650 documents indexed in 294955 ms
08:47:04,823 INFO [STDOUT] 08:47:04,823 INFO SimpleIndexingProgressMonitor:100 - Indexing speed: 337.84814 documents/second; progress: 45.626873%
08:47:04,890 INFO [STDOUT] 08:47:04,890 INFO SimpleIndexingProgressMonitor:97 - 99700 documents indexed in 295022 ms
08:47:04,891 INFO [STDOUT] 08:47:04,891 INFO SimpleIndexingProgressMonitor:100 - Indexing speed: 337.9409 documents/second; progress: 45.649765%
08:47:04,965 INFO [STDOUT] 08:47:04,964 INFO BasicResourcePool:1392 - A checked-out resource is overdue, and will be destroyed: com.mchange.v2.c3p0.impl.NewPooledConnection@ee64cf
08:47:04,971 INFO [STDOUT] 08:47:04,966 INFO BasicResourcePool:1395 - Logging the stack trace by which the overdue resource was checked-out.
08:47:04,972 INFO [STDOUT] java.lang.Exception: DEBUG ONLY: Overdue resource check-out stack trace.
08:47:04,972 INFO [STDOUT] at com.mchange.v2.resourcepool.BasicResourcePool.checkoutResource(BasicResourcePool.java:506)
08:47:04,972 INFO [STDOUT] at com.mchange.v2.c3p0.impl.C3P0PooledConnectionPool.checkoutPooledConnection(C3P0PooledConnectionPool.java:525)
08:47:04,972 INFO [STDOUT] at com.mchange.v2.c3p0.impl.AbstractPoolBackedDataSource.getConnection(AbstractPoolBackedDataSource.java:128)
08:47:04,972 INFO [STDOUT] at org.hibernate.connection.C3P0ConnectionProvider.getConnection(C3P0ConnectionProvider.java:78)
08:47:04,973 INFO [STDOUT] at org.hibernate.jdbc.ConnectionManager.openConnection(ConnectionManager.java:446)
08:47:04,973 INFO [STDOUT] at org.hibernate.jdbc.ConnectionManager.getConnection(ConnectionManager.java:167)
08:47:04,973 INFO [STDOUT] at org.hibernate.jdbc.JDBCContext.connection(JDBCContext.java:160)
08:47:04,973 INFO [STDOUT] at org.hibernate.transaction.JDBCTransaction.begin(JDBCTransaction.java:81)
08:47:04,973 INFO [STDOUT] at org.hibernate.impl.SessionImpl.beginTransaction(SessionImpl.java:1473)
08:47:04,974 INFO [STDOUT] at app.dao.AbstractDAO.initiateLuceneFullReindex(AbstractDAO.java:213)
08:47:04,974 INFO [STDOUT] at app.services.HotelManager.initiateReindex(HotelManager.java:146)
08:47:04,974 INFO [STDOUT] at WICKET_app.services.HotelManager$$FastClassByCGLIB$$e65ccd9e.invoke(<generated>)
08:47:04,974 INFO [STDOUT] at net.sf.cglib.proxy.MethodProxy.invoke(MethodProxy.java:191)
08:47:04,974 INFO [STDOUT] at org.apache.wicket.proxy.LazyInitProxyFactory$CGLibInterceptor.intercept(LazyInitProxyFactory.java:333)
08:47:04,974 INFO [STDOUT] at WICKET_app.services.HotelManager$$EnhancerByCGLIB$$1b4b869d.initiateReindex(<generated>)
08:47:04,975 INFO [STDOUT] at app.web.pages.admin.AddUpdateStaticData$11.onClick(AddUpdateStaticData.java:254)
08:47:04,975 INFO [STDOUT] at org.apache.wicket.ajax.markup.html.AjaxLink$1.onEvent(AjaxLink.java:86)
08:47:04,975 INFO [STDOUT] at org.apache.wicket.ajax.AjaxEventBehavior.respond(AjaxEventBehavior.java:123)
08:47:04,975 INFO [STDOUT] at org.apache.wicket.ajax.AbstractDefaultAjaxBehavior.onRequest(AbstractDefaultAjaxBehavior.java:633)
08:47:04,975 INFO [STDOUT] at sun.reflect.NativeMethodAccessorImpl.invoke0(Native Method)
08:47:04,976 INFO [STDOUT] at sun.reflect.NativeMethodAccessorImpl.invoke(NativeMethodAccessorImpl.java:39)
08:47:04,976 INFO [STDOUT] at sun.reflect.DelegatingMethodAccessorImpl.invoke(DelegatingMethodAccessorImpl.java:25)
08:47:04,976 INFO [STDOUT] at java.lang.reflect.Method.invoke(Method.java:597)
08:47:04,976 INFO [STDOUT] at org.apache.wicket.RequestListenerInterface.internalInvoke(RequestListenerInterface.java:258)
08:47:04,976 INFO [STDOUT] at org.apache.wicket.RequestListenerInterface.invoke(RequestListenerInterface.java:241)
08:47:04,976 INFO [STDOUT] at org.apache.wicket.core.request.handler.ListenerInterfaceRequestHandler.invokeListener(ListenerInterfaceRequestHandler.java:250)
08:47:04,977 INFO [STDOUT] at org.apache.wicket.core.request.handler.ListenerInterfaceRequestHandler.respond(ListenerInterfaceRequestHandler.java:236)
08:47:04,977 INFO [STDOUT] at org.apache.wicket.request.cycle.RequestCycle$HandlerExecutor.respond(RequestCycle.java:862)
08:47:04,977 INFO [STDOUT] at org.apache.wicket.request.RequestHandlerStack.execute(RequestHandlerStack.java:64)
08:47:04,977 INFO [STDOUT] at org.apache.wicket.request.cycle.RequestCycle.execute(RequestCycle.java:261)
08:47:04,977 INFO [STDOUT] at org.apache.wicket.request.cycle.RequestCycle.processRequest(RequestCycle.java:218)
08:47:04,978 INFO [STDOUT] at org.apache.wicket.request.cycle.RequestCycle.processRequestAndDetach(RequestCycle.java:289)
08:47:04,978 INFO [STDOUT] at org.apache.wicket.protocol.http.WicketFilter.processRequestCycle(WicketFilter.java:259)
08:47:04,978 INFO [STDOUT] at org.apache.wicket.protocol.http.WicketFilter.processRequest(WicketFilter.java:201)
08:47:04,978 INFO [STDOUT] at org.apache.wicket.protocol.http.WicketFilter.doFilter(WicketFilter.java:282)
08:47:04,978 INFO [STDOUT] at org.apache.catalina.core.ApplicationFilterChain.internalDoFilter(ApplicationFilterChain.java:274)
08:47:04,978 INFO [STDOUT] at org.apache.catalina.core.ApplicationFilterChain.doFilter(ApplicationFilterChain.java:242)
08:47:04,979 INFO [STDOUT] at org.springframework.orm.hibernate3.support.OpenSessionInViewFilter.doFilterInternal(OpenSessionInViewFilter.java:198)
08:47:04,979 INFO [STDOUT] at org.springframework.web.filter.OncePerRequestFilter.doFilter(OncePerRequestFilter.java:76)
08:47:04,979 INFO [STDOUT] at org.apache.catalina.core.ApplicationFilterChain.internalDoFilter(ApplicationFilterChain.java:274)
08:47:04,979 INFO [STDOUT] at org.apache.catalina.core.ApplicationFilterChain.doFilter(ApplicationFilterChain.java:242)
08:47:04,979 INFO [STDOUT] at org.apache.catalina.core.StandardWrapperValve.invoke(StandardWrapperValve.java:275)
08:47:04,980 INFO [STDOUT] at org.apache.catalina.core.StandardContextValve.invoke(StandardContextValve.java:191)
08:47:04,980 INFO [STDOUT] at org.jboss.web.tomcat.security.JaccContextValve.invoke(JaccContextValve.java:88)
08:47:04,980 INFO [STDOUT] at org.jboss.web.tomcat.security.SecurityContextEstablishmentValve.invoke(SecurityContextEstablishmentValve.java:100)
08:47:04,980 INFO [STDOUT] at org.apache.catalina.core.StandardHostValve.invoke(StandardHostValve.java:127)
08:47:04,980 INFO [STDOUT] at org.apache.catalina.valves.ErrorReportValve.invoke(ErrorReportValve.java:102)
08:47:04,980 INFO [STDOUT] at org.apache.catalina.core.StandardEngineValve.invoke(StandardEngineValve.java:109)
08:47:04,981 INFO [STDOUT] at org.jboss.web.tomcat.service.request.ActiveRequestResponseCacheValve.invoke(ActiveRequestResponseCacheValve.java:53)
08:47:04,981 INFO [STDOUT] at org.apache.catalina.connector.CoyoteAdapter.service(CoyoteAdapter.java:362)
08:47:04,981 INFO [STDOUT] at org.apache.coyote.http11.Http11Processor.process(Http11Processor.java:877)
08:47:04,981 INFO [STDOUT] at org.apache.coyote.http11.Http11Protocol$Http11ConnectionHandler.process(Http11Protocol.java:654)
08:47:04,981 INFO [STDOUT] at org.apache.tomcat.util.net.JIoEndpoint$Worker.run(JIoEndpoint.java:951)
08:47:04,981 INFO [STDOUT] at java.lang.Thread.run(Thread.java:662)
08:47:05,027 INFO [STDOUT] 08:47:05,027 INFO SimpleIndexingProgressMonitor:97 - 99750 documents indexed in 295159 ms
08:47:05,028 INFO [STDOUT] 08:47:05,028 INFO SimpleIndexingProgressMonitor:100 - Indexing speed: 337.95343 documents/second; progress: 45.672657%
08:47:05,162 INFO [STDOUT] 08:47:05,161 INFO SimpleIndexingProgressMonitor:97 - 99800 documents indexed in 295294 ms
08:47:05,162 INFO [STDOUT] 08:47:05,162 INFO SimpleIndexingProgressMonitor:100 - Indexing speed: 337.96826 documents/second; progress: 45.695553%
08:47:05,224 INFO [STDOUT] 08:47:05,224 INFO SimpleIndexingProgressMonitor:97 - 99850 documents indexed in 295356 ms
...
08:47:07,800 INFO [STDOUT] 08:47:07,799 INFO SimpleIndexingProgressMonitor:97 - 101200 documents indexed in 297932 ms
08:47:07,800 INFO [STDOUT] 08:47:07,800 INFO SimpleIndexingProgressMonitor:100 - Indexing speed: 339.67484 documents/second; progress: 46.33657%
08:47:07,867 INFO [STDOUT] 08:47:07,867 INFO SimpleIndexingProgressMonitor:97 - 101250 documents indexed in 297999 ms
08:47:07,893 INFO [STDOUT] 08:47:07,893 INFO SimpleIndexingProgressMonitor:100 - Indexing speed: 339.76624 documents/second; progress: 46.359467%
08:47:07,963 INFO [STDOUT] 08:47:07,963 INFO SimpleIndexingProgressMonitor:97 - 101300 documents indexed in 298095 ms
08:47:07,964 INFO [STDOUT] 08:47:07,964 INFO SimpleIndexingProgressMonitor:100 - Indexing speed: 339.82455 documents/second; progress: 46.38236%
08:47:07,989 INFO [STDOUT] 08:47:07,989 INFO BasicResourcePool:1392 - A checked-out resource is overdue, and will be destroyed: com.mchange.v2.c3p0.impl.NewPooledConnection@1cea63e
08:47:08,011 INFO [STDOUT] 08:47:07,989 INFO BasicResourcePool:1395 - Logging the stack trace by which the overdue resource was checked-out.
08:47:08,011 INFO [STDOUT] java.lang.Exception: DEBUG ONLY: Overdue resource check-out stack trace.
08:47:08,012 INFO [STDOUT] at com.mchange.v2.resourcepool.BasicResourcePool.checkoutResource(BasicResourcePool.java:506)
08:47:08,012 INFO [STDOUT] at com.mchange.v2.c3p0.impl.C3P0PooledConnectionPool.checkoutPooledConnection(C3P0PooledConnectionPool.java:525)
08:47:08,012 INFO [STDOUT] at com.mchange.v2.c3p0.impl.AbstractPoolBackedDataSource.getConnection(AbstractPoolBackedDataSource.java:128)
08:47:08,012 INFO [STDOUT] at org.hibernate.connection.C3P0ConnectionProvider.getConnection(C3P0ConnectionProvider.java:78)
08:47:08,012 INFO [STDOUT] at org.hibernate.jdbc.ConnectionManager.openConnection(ConnectionManager.java:446)
08:47:08,013 INFO [STDOUT] at org.hibernate.jdbc.ConnectionManager.getConnection(ConnectionManager.java:167)
08:47:08,037 INFO [STDOUT] at org.hibernate.jdbc.JDBCContext.connection(JDBCContext.java:160)
08:47:08,037 INFO [STDOUT] at org.hibernate.transaction.JDBCTransaction.begin(JDBCTransaction.java:81)
08:47:08,037 INFO [STDOUT] at org.hibernate.search.batchindexing.EntityConsumerLuceneworkProducer.run(EntityConsumerLuceneworkProducer.java:98)
08:47:08,037 INFO [STDOUT] at org.hibernate.search.batchindexing.OptionallyWrapInJTATransaction.run(OptionallyWrapInJTATransaction.java:107)
08:47:08,037 INFO [STDOUT] at java.util.concurrent.ThreadPoolExecutor$Worker.runTask(ThreadPoolExecutor.java:895)
08:47:08,037 INFO [STDOUT] at java.util.concurrent.ThreadPoolExecutor$Worker.run(ThreadPoolExecutor.java:918)
08:47:08,038 INFO [STDOUT] at java.lang.Thread.run(Thread.java:662)
08:47:08,038 INFO [STDOUT] 08:47:08,038 INFO BasicResourcePool:1392 - A checked-out resource is overdue, and will be destroyed: com.mchange.v2.c3p0.impl.NewPooledConnection@11c4af
08:47:08,039 INFO [STDOUT] 08:47:08,039 INFO BasicResourcePool:1395 - Logging the stack trace by which the overdue resource was checked-out.
08:47:08,039 INFO [STDOUT] java.lang.Exception: DEBUG ONLY: Overdue resource check-out stack trace.
08:47:08,039 INFO [STDOUT] at com.mchange.v2.resourcepool.BasicResourcePool.checkoutResource(BasicResourcePool.java:506)
08:47:08,041 INFO [STDOUT] at com.mchange.v2.c3p0.impl.C3P0PooledConnectionPool.checkoutPooledConnection(C3P0PooledConnectionPool.java:525)
08:47:08,042 INFO [STDOUT] at com.mchange.v2.c3p0.impl.AbstractPoolBackedDataSource.getConnection(AbstractPoolBackedDataSource.java:128)
08:47:08,043 INFO [STDOUT] at org.hibernate.connection.C3P0ConnectionProvider.getConnection(C3P0ConnectionProvider.java:78)
08:47:08,043 INFO [STDOUT] at org.hibernate.jdbc.ConnectionManager.openConnection(ConnectionManager.java:446)
08:47:08,044 INFO [STDOUT] at org.hibernate.jdbc.ConnectionManager.getConnection(ConnectionManager.java:167)
08:47:08,044 INFO [STDOUT] at org.hibernate.jdbc.JDBCContext.connection(JDBCContext.java:160)
08:47:08,045 INFO [STDOUT] at org.hibernate.transaction.JDBCTransaction.begin(JDBCTransaction.java:81)
08:47:08,045 INFO [STDOUT] at org.hibernate.search.batchindexing.EntityConsumerLuceneworkProducer.run(EntityConsumerLuceneworkProducer.java:98)
08:47:08,046 INFO [STDOUT] at org.hibernate.search.batchindexing.OptionallyWrapInJTATransaction.run(OptionallyWrapInJTATransaction.java:107)
08:47:08,047 INFO [STDOUT] at java.util.concurrent.ThreadPoolExecutor$Worker.runTask(ThreadPoolExecutor.java:895)
08:47:08,047 INFO [STDOUT] at java.util.concurrent.ThreadPoolExecutor$Worker.run(ThreadPoolExecutor.java:918)
08:47:08,048 INFO [STDOUT] at java.lang.Thread.run(Thread.java:662)
08:47:08,049 INFO [STDOUT] 08:47:08,049 INFO BasicResourcePool:1392 - A checked-out resource is overdue, and will be destroyed: com.mchange.v2.c3p0.impl.NewPooledConnection@3812b1
08:47:08,055 INFO [STDOUT] 08:47:08,050 INFO BasicResourcePool:1395 - Logging the stack trace by which the overdue resource was checked-out.
08:47:08,056 INFO [STDOUT] java.lang.Exception: DEBUG ONLY: Overdue resource check-out stack trace.
08:47:08,056 INFO [STDOUT] at com.mchange.v2.resourcepool.BasicResourcePool.checkoutResource(BasicResourcePool.java:506)
08:47:08,058 INFO [STDOUT] at com.mchange.v2.c3p0.impl.C3P0PooledConnectionPool.checkoutPooledConnection(C3P0PooledConnectionPool.java:525)
08:47:08,059 INFO [STDOUT] at com.mchange.v2.c3p0.impl.AbstractPoolBackedDataSource.getConnection(AbstractPoolBackedDataSource.java:128)
08:47:08,059 INFO [STDOUT] at org.hibernate.connection.C3P0ConnectionProvider.getConnection(C3P0ConnectionProvider.java:78)
08:47:08,060 INFO [STDOUT] at org.hibernate.jdbc.ConnectionManager.openConnection(ConnectionManager.java:446)
08:47:08,060 INFO [STDOUT] at org.hibernate.jdbc.ConnectionManager.getConnection(ConnectionManager.java:167)
08:47:08,061 INFO [STDOUT] at org.hibernate.jdbc.JDBCContext.connection(JDBCContext.java:160)
08:47:08,061 INFO [STDOUT] at org.hibernate.transaction.JDBCTransaction.begin(JDBCTransaction.java:81)
08:47:08,085 INFO [STDOUT] at org.hibernate.search.batchindexing.IdentifierConsumerEntityProducer.run(IdentifierConsumerEntityProducer.java:86)
08:47:08,085 INFO [STDOUT] at org.hibernate.search.batchindexing.OptionallyWrapInJTATransaction.run(OptionallyWrapInJTATransaction.java:107)
08:47:08,085 INFO [STDOUT] at java.util.concurrent.ThreadPoolExecutor$Worker.runTask(ThreadPoolExecutor.java:895)
08:47:08,086 INFO [STDOUT] at java.util.concurrent.ThreadPoolExecutor$Worker.run(ThreadPoolExecutor.java:918)
08:47:08,086 INFO [STDOUT] at java.lang.Thread.run(Thread.java:662)
08:47:08,087 INFO [STDOUT] 08:47:08,087 INFO BasicResourcePool:1392 - A checked-out resource is overdue, and will be destroyed: com.mchange.v2.c3p0.impl.NewPooledConnection@6353e6
08:47:08,090 INFO [STDOUT] 08:47:08,088 INFO BasicResourcePool:1395 - Logging the stack trace by which the overdue resource was checked-out.
08:47:08,091 INFO [STDOUT] java.lang.Exception: DEBUG ONLY: Overdue resource check-out stack trace.
08:47:08,091 INFO [STDOUT] at com.mchange.v2.resourcepool.BasicResourcePool.checkoutResource(BasicResourcePool.java:506)
08:47:08,092 INFO [STDOUT] at com.mchange.v2.c3p0.impl.C3P0PooledConnectionPool.checkoutPooledConnection(C3P0PooledConnectionPool.java:525)
08:47:08,095 INFO [STDOUT] at com.mchange.v2.c3p0.impl.AbstractPoolBackedDataSource.getConnection(AbstractPoolBackedDataSource.java:128)
08:47:08,095 INFO [STDOUT] at org.hibernate.connection.C3P0ConnectionProvider.getConnection(C3P0ConnectionProvider.java:78)
08:47:08,095 INFO [STDOUT] at org.hibernate.jdbc.ConnectionManager.openConnection(ConnectionManager.java:446)
08:47:08,096 INFO [STDOUT] at org.hibernate.jdbc.ConnectionManager.getConnection(ConnectionManager.java:167)
08:47:08,096 INFO [STDOUT] at org.hibernate.jdbc.JDBCContext.connection(JDBCContext.java:160)
08:47:08,096 INFO [STDOUT] at org.hibernate.transaction.JDBCTransaction.begin(JDBCTransaction.java:81)
08:47:08,096 INFO [STDOUT] at org.hibernate.search.batchindexing.EntityConsumerLuceneworkProducer.run(EntityConsumerLuceneworkProducer.java:98)
08:47:08,096 INFO [STDOUT] at org.hibernate.search.batchindexing.OptionallyWrapInJTATransaction.run(OptionallyWrapInJTATransaction.java:107)
08:47:08,098 INFO [STDOUT] at java.util.concurrent.ThreadPoolExecutor$Worker.runTask(ThreadPoolExecutor.java:895)
08:47:08,098 INFO [STDOUT] at java.util.concurrent.ThreadPoolExecutor$Worker.run(ThreadPoolExecutor.java:918)
08:47:08,098 INFO [STDOUT] at java.lang.Thread.run(Thread.java:662)
08:47:08,099 INFO [STDOUT] 08:47:08,099 INFO BasicResourcePool:1392 - A checked-out resource is overdue, and will be destroyed: com.mchange.v2.c3p0.impl.NewPooledConnection@1d43b84
08:47:08,100 INFO [STDOUT] 08:47:08,099 INFO BasicResourcePool:1395 - Logging the stack trace by which the overdue resource was checked-out.
08:47:08,101 INFO [STDOUT] java.lang.Exception: DEBUG ONLY: Overdue resource check-out stack trace.
08:47:08,101 INFO [STDOUT] at com.mchange.v2.resourcepool.BasicResourcePool.checkoutResource(BasicResourcePool.java:506)
08:47:08,102 INFO [STDOUT] at com.mchange.v2.c3p0.impl.C3P0PooledConnectionPool.checkoutPooledConnection(C3P0PooledConnectionPool.java:525)
08:47:08,102 INFO [STDOUT] at com.mchange.v2.c3p0.impl.AbstractPoolBackedDataSource.getConnection(AbstractPoolBackedDataSource.java:128)
08:47:08,103 INFO [STDOUT] at org.hibernate.connection.C3P0ConnectionProvider.getConnection(C3P0ConnectionProvider.java:78)
08:47:08,104 INFO [STDOUT] at org.hibernate.jdbc.ConnectionManager.openConnection(ConnectionManager.java:446)
08:47:08,104 INFO [STDOUT] at org.hibernate.jdbc.ConnectionManager.getConnection(ConnectionManager.java:167)
08:47:08,104 INFO [STDOUT] at org.hibernate.jdbc.JDBCContext.connection(JDBCContext.java:160)
08:47:08,105 INFO [STDOUT] at org.hibernate.transaction.JDBCTransaction.begin(JDBCTransaction.java:81)
08:47:08,105 INFO [STDOUT] at org.hibernate.search.batchindexing.IdentifierConsumerEntityProducer.run(IdentifierConsumerEntityProducer.java:86)
08:47:08,106 INFO [STDOUT] at org.hibernate.search.batchindexing.OptionallyWrapInJTATransaction.run(OptionallyWrapInJTATransaction.java:107)
08:47:08,106 INFO [STDOUT] at java.util.concurrent.ThreadPoolExecutor$Worker.runTask(ThreadPoolExecutor.java:895)
08:47:08,106 INFO [STDOUT] at java.util.concurrent.ThreadPoolExecutor$Worker.run(ThreadPoolExecutor.java:918)
08:47:08,133 INFO [STDOUT] at java.lang.Thread.run(Thread.java:662)
08:47:08,134 INFO [STDOUT] 08:47:08,133 INFO BasicResourcePool:1392 - A checked-out resource is overdue, and will be destroyed: com.mchange.v2.c3p0.impl.NewPooledConnection@1f175dc
08:47:08,134 INFO [STDOUT] 08:47:08,134 INFO BasicResourcePool:1395 - Logging the stack trace by which the overdue resource was checked-out.
08:47:08,135 INFO [STDOUT] java.lang.Exception: DEBUG ONLY: Overdue resource check-out stack trace.
08:47:08,135 INFO [STDOUT] at com.mchange.v2.resourcepool.BasicResourcePool.checkoutResource(BasicResourcePool.java:506)
08:47:08,135 INFO [STDOUT] at com.mchange.v2.c3p0.impl.C3P0PooledConnectionPool.checkoutPooledConnection(C3P0PooledConnectionPool.java:525)
08:47:08,135 INFO [STDOUT] at com.mchange.v2.c3p0.impl.AbstractPoolBackedDataSource.getConnection(AbstractPoolBackedDataSource.java:128)
08:47:08,135 INFO [STDOUT] at org.hibernate.connection.C3P0ConnectionProvider.getConnection(C3P0ConnectionProvider.java:78)
08:47:08,136 INFO [STDOUT] at org.hibernate.jdbc.ConnectionManager.openConnection(ConnectionManager.java:446)
08:47:08,136 INFO [STDOUT] at org.hibernate.jdbc.ConnectionManager.getConnection(ConnectionManager.java:167)
08:47:08,136 INFO [STDOUT] at org.hibernate.jdbc.JDBCContext.connection(JDBCContext.java:160)
08:47:08,136 INFO [STDOUT] at org.hibernate.transaction.JDBCTransaction.begin(JDBCTransaction.java:81)
08:47:08,136 INFO [STDOUT] at org.hibernate.search.batchindexing.EntityConsumerLuceneworkProducer.run(EntityConsumerLuceneworkProducer.java:98)
08:47:08,136 INFO [STDOUT] at org.hibernate.search.batchindexing.OptionallyWrapInJTATransaction.run(OptionallyWrapInJTATransaction.java:107)
08:47:08,137 INFO [STDOUT] at java.util.concurrent.ThreadPoolExecutor$Worker.runTask(ThreadPoolExecutor.java:895)
08:47:08,137 INFO [STDOUT] at java.util.concurrent.ThreadPoolExecutor$Worker.run(ThreadPoolExecutor.java:918)
08:47:08,137 INFO [STDOUT] at java.lang.Thread.run(Thread.java:662)
08:47:08,137 INFO [STDOUT] 08:47:08,137 INFO BasicResourcePool:1392 - A checked-out resource is overdue, and will be destroyed: com.mchange.v2.c3p0.impl.NewPooledConnection@1c17645
08:47:08,138 INFO [STDOUT] 08:47:08,138 INFO BasicResourcePool:1395 - Logging the stack trace by which the overdue resource was checked-out.
08:47:08,138 INFO [STDOUT] java.lang.Exception: DEBUG ONLY: Overdue resource check-out stack trace.
08:47:08,139 INFO [STDOUT] at com.mchange.v2.resourcepool.BasicResourcePool.checkoutResource(BasicResourcePool.java:506)
08:47:08,139 INFO [STDOUT] at com.mchange.v2.c3p0.impl.C3P0PooledConnectionPool.checkoutPooledConnection(C3P0PooledConnectionPool.java:525)
08:47:08,139 INFO [STDOUT] at com.mchange.v2.c3p0.impl.AbstractPoolBackedDataSource.getConnection(AbstractPoolBackedDataSource.java:128)
08:47:08,139 INFO [STDOUT] at org.hibernate.connection.C3P0ConnectionProvider.getConnection(C3P0ConnectionProvider.java:78)
08:47:08,139 INFO [STDOUT] at org.hibernate.jdbc.ConnectionManager.openConnection(ConnectionManager.java:446)
08:47:08,139 INFO [STDOUT] at org.hibernate.jdbc.ConnectionManager.getConnection(ConnectionManager.java:167)
08:47:08,139 INFO [STDOUT] at org.hibernate.jdbc.JDBCContext.connection(JDBCContext.java:160)
08:47:08,140 INFO [STDOUT] at org.hibernate.transaction.JDBCTransaction.begin(JDBCTransaction.java:81)
08:47:08,140 INFO [STDOUT] at org.hibernate.search.batchindexing.IdentifierProducer.inTransactionWrapper(IdentifierProducer.java:110)
08:47:08,140 INFO [STDOUT] at org.hibernate.search.batchindexing.IdentifierProducer.run(IdentifierProducer.java:92)
08:47:08,140 INFO [STDOUT] at org.hibernate.search.batchindexing.OptionallyWrapInJTATransaction.run(OptionallyWrapInJTATransaction.java:110)
08:47:08,140 INFO [STDOUT] at java.util.concurrent.ThreadPoolExecutor$Worker.runTask(ThreadPoolExecutor.java:895)
08:47:08,140 INFO [STDOUT] at java.util.concurrent.ThreadPoolExecutor$Worker.run(ThreadPoolExecutor.java:918)
08:47:08,141 INFO [STDOUT] at java.lang.Thread.run(Thread.java:662)
08:47:08,154 INFO [STDOUT] 08:47:08,154 WARN JDBCExceptionReporter:233 - SQL Error: 0, SQLState: S1000
08:47:08,244 INFO [STDOUT] 08:47:08,244 ERROR JDBCExceptionReporter:234 - Operation not allowed after ResultSet closed
08:47:08,247 INFO [STDOUT] 08:47:08,246 ERROR IdentifierConsumerEntityProducer:91 - error during batch indexing:
08:47:08,252 INFO [STDOUT] org.hibernate.exception.GenericJDBCException: could not execute query
08:47:08,253 INFO [STDOUT] at org.hibernate.exception.SQLStateConverter.handledNonSpecificException(SQLStateConverter.java:140)
08:47:08,253 INFO [STDOUT] at org.hibernate.exception.SQLStateConverter.convert(SQLStateConverter.java:128)
08:47:08,277 INFO [STDOUT] at org.hibernate.exception.JDBCExceptionHelper.convert(JDBCExceptionHelper.java:66)
08:47:08,277 INFO [STDOUT] at org.hibernate.loader.Loader.doList(Loader.java:2545)
08:47:08,277 INFO [STDOUT] at org.hibernate.loader.Loader.listIgnoreQueryCache(Loader.java:2276)
08:47:08,277 INFO [STDOUT] at org.hibernate.loader.Loader.list(Loader.java:2271)
08:47:08,277 INFO [STDOUT] at org.hibernate.loader.criteria.CriteriaLoader.list(CriteriaLoader.java:119)
08:47:08,277 INFO [STDOUT] at org.hibernate.impl.SessionImpl.list(SessionImpl.java:1716)
08:47:08,278 INFO [STDOUT] at org.hibernate.impl.CriteriaImpl.list(CriteriaImpl.java:347)
08:47:08,278 INFO [STDOUT] at org.hibernate.search.batchindexing.IdentifierConsumerEntityProducer.loadList(IdentifierConsumerEntityProducer.java:141)
08:47:08,278 INFO [STDOUT] at org.hibernate.search.batchindexing.IdentifierConsumerEntityProducer.loadAllFromQueue(IdentifierConsumerEntityProducer.java:110)
08:47:08,278 INFO [STDOUT] at org.hibernate.search.batchindexing.IdentifierConsumerEntityProducer.run(IdentifierConsumerEntityProducer.java:87)
08:47:08,278 INFO [STDOUT] at org.hibernate.search.batchindexing.OptionallyWrapInJTATransaction.run(OptionallyWrapInJTATransaction.java:107)
08:47:08,278 INFO [STDOUT] at java.util.concurrent.ThreadPoolExecutor$Worker.runTask(ThreadPoolExecutor.java:895)
08:47:08,278 INFO [STDOUT] at java.util.concurrent.ThreadPoolExecutor$Worker.run(ThreadPoolExecutor.java:918)
08:47:08,278 INFO [STDOUT] at java.lang.Thread.run(Thread.java:662)
08:47:08,278 INFO [STDOUT] Caused by: java.sql.SQLException: Operation not allowed after ResultSet closed
08:47:08,278 INFO [STDOUT] at com.mysql.jdbc.SQLError.createSQLException(SQLError.java:1073)
08:47:08,278 INFO [STDOUT] at com.mysql.jdbc.SQLError.createSQLException(SQLError.java:987)
08:47:08,278 INFO [STDOUT] at com.mysql.jdbc.SQLError.createSQLException(SQLError.java:982)
08:47:08,278 INFO [STDOUT] at com.mysql.jdbc.SQLError.createSQLException(SQLError.java:927)
08:47:08,278 INFO [STDOUT] at com.mysql.jdbc.ResultSetImpl.checkClosed(ResultSetImpl.java:794)
08:47:08,278 INFO [STDOUT] at com.mysql.jdbc.ResultSetImpl.next(ResultSetImpl.java:7139)
08:47:08,278 INFO [STDOUT] at com.mchange.v2.c3p0.impl.NewProxyResultSet.next(NewProxyResultSet.java:2859)
08:47:08,278 INFO [STDOUT] at org.hibernate.loader.Loader.doQuery(Loader.java:825)
08:47:08,279 INFO [STDOUT] at org.hibernate.loader.Loader.doQueryAndInitializeNonLazyCollections(Loader.java:274)
08:47:08,279 INFO [STDOUT] at org.hibernate.loader.Loader.doList(Loader.java:2542)
08:47:08,279 INFO [STDOUT] ... 12 more
08:47:08,284 INFO [STDOUT] 08:47:08,229 WARN JDBCExceptionReporter:233 - SQL Error: 0, SQLState: S1000
08:47:08,284 INFO [STDOUT] 08:47:08,284 ERROR JDBCExceptionReporter:234 - Operation not allowed after ResultSet closed
08:47:08,285 INFO [STDOUT] 08:47:08,285 ERROR JDBCTransaction:151 - JDBC commit failed
08:47:08,285 INFO [STDOUT] com.mysql.jdbc.exceptions.jdbc4.MySQLNonTransientConnectionException: No operations allowed after connection closed.
08:47:08,286 INFO [STDOUT] at sun.reflect.NativeConstructorAccessorImpl.newInstance0(Native Method)
08:47:08,286 INFO [STDOUT] at sun.reflect.NativeConstructorAccessorImpl.newInstance(NativeConstructorAccessorImpl.java:39)
08:47:08,286 INFO [STDOUT] at sun.reflect.DelegatingConstructorAccessorImpl.newInstance(DelegatingConstructorAccessorImpl.java:27)
08:47:08,286 INFO [STDOUT] at java.lang.reflect.Constructor.newInstance(Constructor.java:513)
08:47:08,286 INFO [STDOUT] at com.mysql.jdbc.Util.handleNewInstance(Util.java:411)
08:47:08,286 INFO [STDOUT] at com.mysql.jdbc.Util.getInstance(Util.java:386)
08:47:08,286 INFO [STDOUT] at com.mysql.jdbc.SQLError.createSQLException(SQLError.java:1013)
08:47:08,286 INFO [STDOUT] at com.mysql.jdbc.SQLError.createSQLException(SQLError.java:987)
08:47:08,286 INFO [STDOUT] at com.mysql.jdbc.SQLError.createSQLException(SQLError.java:982)
08:47:08,286 INFO [STDOUT] at com.mysql.jdbc.SQLError.createSQLException(SQLError.java:927)
08:47:08,286 INFO [STDOUT] at com.mysql.jdbc.ConnectionImpl.throwConnectionClosedException(ConnectionImpl.java:1206)
08:47:08,286 INFO [STDOUT] at com.mysql.jdbc.ConnectionImpl.checkClosed(ConnectionImpl.java:1198)
08:47:08,286 INFO [STDOUT] at com.mysql.jdbc.ConnectionImpl.commit(ConnectionImpl.java:1625)
08:47:08,286 INFO [STDOUT] at com.mchange.v2.c3p0.impl.NewProxyConnection.commit(NewProxyConnection.java:803)
08:47:08,286 INFO [STDOUT] at org.hibernate.transaction.JDBCTransaction.commitAndResetAutoCommit(JDBCTransaction.java:166)
08:47:08,286 INFO [STDOUT] at org.hibernate.transaction.JDBCTransaction.commit(JDBCTransaction.java:142)
08:47:08,287 INFO [STDOUT] at org.hibernate.search.batchindexing.EntityConsumerLuceneworkProducer.run(EntityConsumerLuceneworkProducer.java:100)
08:47:08,287 INFO [STDOUT] at org.hibernate.search.batchindexing.OptionallyWrapInJTATransaction.run(OptionallyWrapInJTATransaction.java:107)
08:47:08,287 INFO [STDOUT] at java.util.concurrent.ThreadPoolExecutor$Worker.runTask(ThreadPoolExecutor.java:895)
08:47:08,287 INFO [STDOUT] at java.util.concurrent.ThreadPoolExecutor$Worker.run(ThreadPoolExecutor.java:918)
08:47:08,287 INFO [STDOUT] at java.lang.Thread.run(Thread.java:662)
08:47:08,289 INFO [STDOUT] 08:47:08,287 ERROR EntityConsumerLuceneworkProducer:103 - error during batch indexing:
08:47:08,289 INFO [STDOUT] org.hibernate.TransactionException: JDBC commit failed
08:47:08,289 INFO [STDOUT] at org.hibernate.transaction.JDBCTransaction.commit(JDBCTransaction.java:157)
08:47:08,289 INFO [STDOUT] at org.hibernate.search.batchindexing.EntityConsumerLuceneworkProducer.run(EntityConsumerLuceneworkProducer.java:100)
08:47:08,289 INFO [STDOUT] at org.hibernate.search.batchindexing.OptionallyWrapInJTATransaction.run(OptionallyWrapInJTATransaction.java:107)
08:47:08,289 INFO [STDOUT] at java.util.concurrent.ThreadPoolExecutor$Worker.runTask(ThreadPoolExecutor.java:895)
08:47:08,289 INFO [STDOUT] at java.util.concurrent.ThreadPoolExecutor$Worker.run(ThreadPoolExecutor.java:918)
08:47:08,289 INFO [STDOUT] at java.lang.Thread.run(Thread.java:662)
08:47:08,289 INFO [STDOUT] Caused by: com.mysql.jdbc.exceptions.jdbc4.MySQLNonTransientConnectionException: No operations allowed after connection closed.
08:47:08,289 INFO [STDOUT] at sun.reflect.NativeConstructorAccessorImpl.newInstance0(Native Method)
08:47:08,289 INFO [STDOUT] at sun.reflect.NativeConstructorAccessorImpl.newInstance(NativeConstructorAccessorImpl.java:39)
08:47:08,289 INFO [STDOUT] at sun.reflect.DelegatingConstructorAccessorImpl.newInstance(DelegatingConstructorAccessorImpl.java:27)
08:47:08,289 INFO [STDOUT] at java.lang.reflect.Constructor.newInstance(Constructor.java:513)
08:47:08,292 INFO [STDOUT] at com.mysql.jdbc.Util.handleNewInstance(Util.java:411)
08:47:08,293 INFO [STDOUT] at com.mysql.jdbc.Util.getInstance(Util.java:386)
08:47:08,293 INFO [STDOUT] at com.mysql.jdbc.SQLError.createSQLException(SQLError.java:1013)
08:47:08,293 INFO [STDOUT] at com.mysql.jdbc.SQLError.createSQLException(SQLError.java:987)
08:47:08,293 INFO [STDOUT] at com.mysql.jdbc.SQLError.createSQLException(SQLError.java:982)
08:47:08,293 INFO [STDOUT] at com.mysql.jdbc.SQLError.createSQLException(SQLError.java:927)
08:47:08,293 INFO [STDOUT] at com.mysql.jdbc.ConnectionImpl.throwConnectionClosedException(ConnectionImpl.java:1206)
08:47:08,293 INFO [STDOUT] at com.mysql.jdbc.ConnectionImpl.checkClosed(ConnectionImpl.java:1198)
08:47:08,293 INFO [STDOUT] at com.mysql.jdbc.ConnectionImpl.commit(ConnectionImpl.java:1625)
08:47:08,293 INFO [STDOUT] at com.mchange.v2.c3p0.impl.NewProxyConnection.commit(NewProxyConnection.java:803)
08:47:08,293 INFO [STDOUT] at org.hibernate.transaction.JDBCTransaction.commitAndResetAutoCommit(JDBCTransaction.java:166)
08:47:08,293 INFO [STDOUT] at org.hibernate.transaction.JDBCTransaction.commit(JDBCTransaction.java:142)
08:47:08,293 INFO [STDOUT] ... 5 more
08:47:08,296 INFO [STDOUT] 08:47:08,288 ERROR IdentifierConsumerEntityProducer:91 - error during batch indexing:
08:47:08,296 INFO [STDOUT] org.hibernate.exception.GenericJDBCException: could not initialize a collection: [app.model.hotel.Hotel.images#63486]
08:47:08,297 INFO [STDOUT] at org.hibernate.exception.SQLStateConverter.handledNonSpecificException(SQLStateConverter.java:140)
08:47:08,297 INFO [STDOUT] at org.hibernate.exception.SQLStateConverter.convert(SQLStateConverter.java:128)
08:47:08,297 INFO [STDOUT] at org.hibernate.exception.JDBCExceptionHelper.convert(JDBCExceptionHelper.java:66)
08:47:08,297 INFO [STDOUT] at org.hibernate.loader.Loader.loadCollection(Loader.java:2173)
08:47:08,297 INFO [STDOUT] at org.hibernate.loader.collection.CollectionLoader.initialize(CollectionLoader.java:62)
08:47:08,297 INFO [STDOUT] at org.hibernate.persister.collection.AbstractCollectionPersister.initialize(AbstractCollectionPersister.java:627)
08:47:08,297 INFO [STDOUT] at org.hibernate.event.def.DefaultInitializeCollectionEventListener.onInitializeCollection(DefaultInitializeCollectionEventListener.java:83)
08:47:08,297 INFO [STDOUT] at org.hibernate.impl.SessionImpl.initializeCollection(SessionImpl.java:1863)
08:47:08,297 INFO [STDOUT] at org.hibernate.collection.AbstractPersistentCollection.forceInitialization(AbstractPersistentCollection.java:479)
08:47:08,297 INFO [STDOUT] at org.hibernate.engine.StatefulPersistenceContext.initializeNonLazyCollections(StatefulPersistenceContext.java:900)
08:47:08,297 INFO [STDOUT] at org.hibernate.loader.Loader.doQueryAndInitializeNonLazyCollections(Loader.java:279)
08:47:08,297 INFO [STDOUT] at org.hibernate.loader.Loader.doList(Loader.java:2542)
08:47:08,297 INFO [STDOUT] at org.hibernate.loader.Loader.listIgnoreQueryCache(Loader.java:2276)
08:47:08,297 INFO [STDOUT] at org.hibernate.loader.Loader.list(Loader.java:2271)
08:47:08,297 INFO [STDOUT] at org.hibernate.loader.criteria.CriteriaLoader.list(CriteriaLoader.java:119)
08:47:08,297 INFO [STDOUT] at org.hibernate.impl.SessionImpl.list(SessionImpl.java:1716)
08:47:08,298 INFO [STDOUT] at org.hibernate.impl.CriteriaImpl.list(CriteriaImpl.java:347)
08:47:08,298 INFO [STDOUT] at org.hibernate.search.batchindexing.IdentifierConsumerEntityProducer.loadList(IdentifierConsumerEntityProducer.java:141)
08:47:08,298 INFO [STDOUT] at org.hibernate.search.batchindexing.IdentifierConsumerEntityProducer.loadAllFromQueue(IdentifierConsumerEntityProducer.java:110)
08:47:08,298 INFO [STDOUT] at org.hibernate.search.batchindexing.IdentifierConsumerEntityProducer.run(IdentifierConsumerEntityProducer.java:87)
08:47:08,298 INFO [STDOUT] at org.hibernate.search.batchindexing.OptionallyWrapInJTATransaction.run(OptionallyWrapInJTATransaction.java:107)
08:47:08,298 INFO [STDOUT] at java.util.concurrent.ThreadPoolExecutor$Worker.runTask(ThreadPoolExecutor.java:895)
08:47:08,298 INFO [STDOUT] at java.util.concurrent.ThreadPoolExecutor$Worker.run(ThreadPoolExecutor.java:918)
08:47:08,298 INFO [STDOUT] at java.lang.Thread.run(Thread.java:662)
08:47:08,298 INFO [STDOUT] Caused by: java.sql.SQLException: Operation not allowed after ResultSet closed
08:47:08,298 INFO [STDOUT] at com.mysql.jdbc.SQLError.createSQLException(SQLError.java:1073)
08:47:08,298 INFO [STDOUT] at com.mysql.jdbc.SQLError.createSQLException(SQLError.java:987)
08:47:08,298 INFO [STDOUT] at com.mysql.jdbc.SQLError.createSQLException(SQLError.java:982)
08:47:08,298 INFO [STDOUT] at com.mysql.jdbc.SQLError.createSQLException(SQLError.java:927)
08:47:08,298 INFO [STDOUT] at com.mysql.jdbc.ResultSetImpl.checkClosed(ResultSetImpl.java:794)
08:47:08,298 INFO [STDOUT] at com.mysql.jdbc.ResultSetImpl.next(ResultSetImpl.java:7139)
08:47:08,298 INFO [STDOUT] at com.mchange.v2.c3p0.impl.NewProxyResultSet.next(NewProxyResultSet.java:2859)
08:47:08,298 INFO [STDOUT] at org.hibernate.loader.Loader.doQuery(Loader.java:825)
08:47:08,299 INFO [STDOUT] at org.hibernate.loader.Loader.doQueryAndInitializeNonLazyCollections(Loader.java:274)
08:47:08,299 INFO [STDOUT] at org.hibernate.loader.Loader.loadCollection(Loader.java:2166)
08:47:08,299 INFO [STDOUT] ... 20 more
08:47:08,300 INFO [STDOUT] 08:47:08,288 ERROR JDBCTransaction:151 - JDBC commit failed
08:47:08,300 INFO [STDOUT] com.mysql.jdbc.exceptions.jdbc4.MySQLNonTransientConnectionException: No operations allowed after connection closed.
08:47:08,300 INFO [STDOUT] at sun.reflect.NativeConstructorAccessorImpl.newInstance0(Native Method)
08:47:08,300 INFO [STDOUT] at sun.reflect.NativeConstructorAccessorImpl.newInstance(NativeConstructorAccessorImpl.java:39)
08:47:08,300 INFO [STDOUT] at sun.reflect.DelegatingConstructorAccessorImpl.newInstance(DelegatingConstructorAccessorImpl.java:27)
08:47:08,300 INFO [STDOUT] at java.lang.reflect.Constructor.newInstance(Constructor.java:513)
08:47:08,300 INFO [STDOUT] at com.mysql.jdbc.Util.handleNewInstance(Util.java:411)
08:47:08,300 INFO [STDOUT] at com.mysql.jdbc.Util.getInstance(Util.java:386)
08:47:08,300 INFO [STDOUT] at com.mysql.jdbc.SQLError.createSQLException(SQLError.java:1013)
08:47:08,300 INFO [STDOUT] at com.mysql.jdbc.SQLError.createSQLException(SQLError.java:987)
08:47:08,300 INFO [STDOUT] at com.mysql.jdbc.SQLError.createSQLException(SQLError.java:982)
08:47:08,300 INFO [STDOUT] at com.mysql.jdbc.SQLError.createSQLException(SQLError.java:927)
08:47:08,300 INFO [STDOUT] at com.mysql.jdbc.ConnectionImpl.throwConnectionClosedException(ConnectionImpl.java:1206)
08:47:08,300 INFO [STDOUT] at com.mysql.jdbc.ConnectionImpl.checkClosed(ConnectionImpl.java:1198)
08:47:08,300 INFO [STDOUT] at com.mysql.jdbc.ConnectionImpl.commit(ConnectionImpl.java:1625)
08:47:08,301 INFO [STDOUT] at com.mchange.v2.c3p0.impl.NewProxyConnection.commit(NewProxyConnection.java:803)
08:47:08,301 INFO [STDOUT] at org.hibernate.transaction.JDBCTransaction.commitAndResetAutoCommit(JDBCTransaction.java:166)
08:47:08,301 INFO [STDOUT] at org.hibernate.transaction.JDBCTransaction.commit(JDBCTransaction.java:142)
08:47:08,301 INFO [STDOUT] at org.hibernate.search.batchindexing.EntityConsumerLuceneworkProducer.run(EntityConsumerLuceneworkProducer.java:100)
08:47:08,373 INFO [STDOUT] at org.hibernate.search.batchindexing.OptionallyWrapInJTATransaction.run(OptionallyWrapInJTATransaction.java:107)
08:47:08,373 INFO [STDOUT] at java.util.concurrent.ThreadPoolExecutor$Worker.runTask(ThreadPoolExecutor.java:895)
08:47:08,374 INFO [STDOUT] at java.util.concurrent.ThreadPoolExecutor$Worker.run(ThreadPoolExecutor.java:918)
08:47:08,374 INFO [STDOUT] at java.lang.Thread.run(Thread.java:662)
08:47:08,375 INFO [STDOUT] 08:47:08,288 ERROR JDBCTransaction:151 - JDBC commit failed
08:47:08,375 INFO [STDOUT] com.mysql.jdbc.exceptions.jdbc4.MySQLNonTransientConnectionException: No operations allowed after connection closed.
08:47:08,375 INFO [STDOUT] at sun.reflect.NativeConstructorAccessorImpl.newInstance0(Native Method)
08:47:08,375 INFO [STDOUT] at sun.reflect.NativeConstructorAccessorImpl.newInstance(NativeConstructorAccessorImpl.java:39)
08:47:08,375 INFO [STDOUT] at sun.reflect.DelegatingConstructorAccessorImpl.newInstance(DelegatingConstructorAccessorImpl.java:27)
08:47:08,375 INFO [STDOUT] at java.lang.reflect.Constructor.newInstance(Constructor.java:513)
08:47:08,376 INFO [STDOUT] at com.mysql.jdbc.Util.handleNewInstance(Util.java:411)
08:47:08,376 INFO [STDOUT] at com.mysql.jdbc.Util.getInstance(Util.java:386)
08:47:08,376 INFO [STDOUT] at com.mysql.jdbc.SQLError.createSQLException(SQLError.java:1013)
08:47:08,376 INFO [STDOUT] at com.mysql.jdbc.SQLError.createSQLException(SQLError.java:987)
08:47:08,376 INFO [STDOUT] at com.mysql.jdbc.SQLError.createSQLException(SQLError.java:982)
08:47:08,376 INFO [STDOUT] at com.mysql.jdbc.SQLError.createSQLException(SQLError.java:927)
08:47:08,376 INFO [STDOUT] at com.mysql.jdbc.ConnectionImpl.throwConnectionClosedException(ConnectionImpl.java:1206)
08:47:08,377 INFO [STDOUT] at com.mysql.jdbc.ConnectionImpl.checkClosed(ConnectionImpl.java:1198)
08:47:08,377 INFO [STDOUT] at com.mysql.jdbc.ConnectionImpl.commit(ConnectionImpl.java:1625)
08:47:08,377 INFO [STDOUT] at com.mchange.v2.c3p0.impl.NewProxyConnection.commit(NewProxyConnection.java:803)
08:47:08,377 INFO [STDOUT] at org.hibernate.transaction.JDBCTransaction.commitAndResetAutoCommit(JDBCTransaction.java:166)
08:47:08,377 INFO [STDOUT] at org.hibernate.transaction.JDBCTransaction.commit(JDBCTransaction.java:142)
08:47:08,377 INFO [STDOUT] at org.hibernate.search.batchindexing.EntityConsumerLuceneworkProducer.run(EntityConsumerLuceneworkProducer.java:100)
08:47:08,377 INFO [STDOUT] at org.hibernate.search.batchindexing.OptionallyWrapInJTATransaction.run(OptionallyWrapInJTATransaction.java:107)
08:47:08,378 INFO [STDOUT] at java.util.concurrent.ThreadPoolExecutor$Worker.runTask(ThreadPoolExecutor.java:895)
08:47:08,378 INFO [STDOUT] at java.util.concurrent.ThreadPoolExecutor$Worker.run(ThreadPoolExecutor.java:918)
08:47:08,378 INFO [STDOUT] at java.lang.Thread.run(Thread.java:662)
08:47:08,379 INFO [STDOUT] 08:47:08,287 ERROR JDBCTransaction:151 - JDBC commit failed
08:47:08,379 INFO [STDOUT] com.mysql.jdbc.exceptions.jdbc4.MySQLNonTransientConnectionException: No operations allowed after connection closed.
08:47:08,379 INFO [STDOUT] at sun.reflect.NativeConstructorAccessorImpl.newInstance0(Native Method)
08:47:08,379 INFO [STDOUT] at sun.reflect.NativeConstructorAccessorImpl.newInstance(NativeConstructorAccessorImpl.java:39)
08:47:08,379 INFO [STDOUT] at sun.reflect.DelegatingConstructorAccessorImpl.newInstance(DelegatingConstructorAccessorImpl.java:27)
08:47:08,379 INFO [STDOUT] at java.lang.reflect.Constructor.newInstance(Constructor.java:513)
08:47:08,379 INFO [STDOUT] at com.mysql.jdbc.Util.handleNewInstance(Util.java:411)
08:47:08,380 INFO [STDOUT] at com.mysql.jdbc.Util.getInstance(Util.java:386)
08:47:08,380 INFO [STDOUT] at com.mysql.jdbc.SQLError.createSQLException(SQLError.java:1013)
08:47:08,380 INFO [STDOUT] at com.mysql.jdbc.SQLError.createSQLException(SQLError.java:987)
08:47:08,380 INFO [STDOUT] at com.mysql.jdbc.SQLError.createSQLException(SQLError.java:982)
08:47:08,380 INFO [STDOUT] at com.mysql.jdbc.SQLError.createSQLException(SQLError.java:927)
08:47:08,380 INFO [STDOUT] at com.mysql.jdbc.ConnectionImpl.throwConnectionClosedException(ConnectionImpl.java:1206)
08:47:08,380 INFO [STDOUT] at com.mysql.jdbc.ConnectionImpl.checkClosed(ConnectionImpl.java:1198)
08:47:08,381 INFO [STDOUT] at com.mysql.jdbc.ConnectionImpl.commit(ConnectionImpl.java:1625)
08:47:08,381 INFO [STDOUT] at com.mchange.v2.c3p0.impl.NewProxyConnection.commit(NewProxyConnection.java:803)
08:47:08,381 INFO [STDOUT] at org.hibernate.transaction.JDBCTransaction.commitAndResetAutoCommit(JDBCTransaction.java:166)
08:47:08,381 INFO [STDOUT] at org.hibernate.transaction.JDBCTransaction.commit(JDBCTransaction.java:142)
08:47:08,381 INFO [STDOUT] at org.hibernate.search.batchindexing.EntityConsumerLuceneworkProducer.run(EntityConsumerLuceneworkProducer.java:100)
08:47:08,381 INFO [STDOUT] at org.hibernate.search.batchindexing.OptionallyWrapInJTATransaction.run(OptionallyWrapInJTATransaction.java:107)
08:47:08,381 INFO [STDOUT] at java.util.concurrent.ThreadPoolExecutor$Worker.runTask(ThreadPoolExecutor.java:895)
08:47:08,382 INFO [STDOUT] at java.util.concurrent.ThreadPoolExecutor$Worker.run(ThreadPoolExecutor.java:918)
08:47:08,382 INFO [STDOUT] at java.lang.Thread.run(Thread.java:662)
08:47:08,382 INFO [STDOUT] 08:47:08,334 WARN LoadContexts:132 - fail-safe cleanup (collections) : org.hibernate.engine.loading.CollectionLoadContext@17601d0<rs=com.mchange.v2.c3p0.impl.NewProxyResultSet@121b338>
08:47:08,383 INFO [STDOUT] 08:47:08,382 WARN CollectionLoadContext:361 - On CollectionLoadContext#cleanup, localLoadingCollectionKeys contained [1] entries
08:47:08,384 INFO [STDOUT] 08:47:08,374 ERROR EntityConsumerLuceneworkProducer:103 - error during batch indexing:
08:47:08,384 INFO [STDOUT] org.hibernate.TransactionException: JDBC commit failed
08:47:08,384 INFO [STDOUT] at org.hibernate.transaction.JDBCTransaction.commit(JDBCTransaction.java:157)
08:47:08,384 INFO [STDOUT] at org.hibernate.search.batchindexing.EntityConsumerLuceneworkProducer.run(EntityConsumerLuceneworkProducer.java:100)
08:47:08,384 INFO [STDOUT] at org.hibernate.search.batchindexing.OptionallyWrapInJTATransaction.run(OptionallyWrapInJTATransaction.java:107)
08:47:08,384 INFO [STDOUT] at java.util.concurrent.ThreadPoolExecutor$Worker.runTask(ThreadPoolExecutor.java:895)
08:47:08,385 INFO [STDOUT] at java.util.concurrent.ThreadPoolExecutor$Worker.run(ThreadPoolExecutor.java:918)
08:47:08,385 INFO [STDOUT] at java.lang.Thread.run(Thread.java:662)
08:47:08,385 INFO [STDOUT] Caused by: com.mysql.jdbc.exceptions.jdbc4.MySQLNonTransientConnectionException: No operations allowed after connection closed.
08:47:08,385 INFO [STDOUT] at sun.reflect.NativeConstructorAccessorImpl.newInstance0(Native Method)
08:47:08,385 INFO [STDOUT] at sun.reflect.NativeConstructorAccessorImpl.newInstance(NativeConstructorAccessorImpl.java:39)
08:47:08,385 INFO [STDOUT] at sun.reflect.DelegatingConstructorAccessorImpl.newInstance(DelegatingConstructorAccessorImpl.java:27)
08:47:08,385 INFO [STDOUT] at java.lang.reflect.Constructor.newInstance(Constructor.java:513)
08:47:08,386 INFO [STDOUT] at com.mysql.jdbc.Util.handleNewInstance(Util.java:411)
08:47:08,386 INFO [STDOUT] at com.mysql.jdbc.Util.getInstance(Util.java:386)
08:47:08,386 INFO [STDOUT] at com.mysql.jdbc.SQLError.createSQLException(SQLError.java:1013)
08:47:08,386 INFO [STDOUT] at com.mysql.jdbc.SQLError.createSQLException(SQLError.java:987)
08:47:08,386 INFO [STDOUT] at com.mysql.jdbc.SQLError.createSQLException(SQLError.java:982)
08:47:08,386 INFO [STDOUT] at com.mysql.jdbc.SQLError.createSQLException(SQLError.java:927)
08:47:08,386 INFO [STDOUT] at com.mysql.jdbc.ConnectionImpl.throwConnectionClosedException(ConnectionImpl.java:1206)
08:47:08,387 INFO [STDOUT] at com.mysql.jdbc.ConnectionImpl.checkClosed(ConnectionImpl.java:1198)
08:47:08,387 INFO [STDOUT] at com.mysql.jdbc.ConnectionImpl.commit(ConnectionImpl.java:1625)
08:47:08,387 INFO [STDOUT] at com.mchange.v2.c3p0.impl.NewProxyConnection.commit(NewProxyConnection.java:803)
08:47:08,387 INFO [STDOUT] at org.hibernate.transaction.JDBCTransaction.commitAndResetAutoCommit(JDBCTransaction.java:166)
08:47:08,387 INFO [STDOUT] at org.hibernate.transaction.JDBCTransaction.commit(JDBCTransaction.java:142)
08:47:08,387 INFO [STDOUT] ... 5 more
08:47:08,388 INFO [STDOUT] 08:47:08,383 ERROR EntityConsumerLuceneworkProducer:103 - error during batch indexing:
08:47:08,388 INFO [STDOUT] org.hibernate.TransactionException: JDBC commit failed
08:47:08,388 INFO [STDOUT] at org.hibernate.transaction.JDBCTransaction.commit(JDBCTransaction.java:157)
08:47:08,389 INFO [STDOUT] at org.hibernate.search.batchindexing.EntityConsumerLuceneworkProducer.run(EntityConsumerLuceneworkProducer.java:100)
08:47:08,389 INFO [STDOUT] at org.hibernate.search.batchindexing.OptionallyWrapInJTATransaction.run(OptionallyWrapInJTATransaction.java:107)
08:47:08,389 INFO [STDOUT] at java.util.concurrent.ThreadPoolExecutor$Worker.runTask(ThreadPoolExecutor.java:895)
08:47:08,389 INFO [STDOUT] at java.util.concurrent.ThreadPoolExecutor$Worker.run(ThreadPoolExecutor.java:918)
08:47:08,389 INFO [STDOUT] at java.lang.Thread.run(Thread.java:662)
08:47:08,390 INFO [STDOUT] Caused by: com.mysql.jdbc.exceptions.jdbc4.MySQLNonTransientConnectionException: No operations allowed after connection closed.
08:47:08,390 INFO [STDOUT] at sun.reflect.NativeConstructorAccessorImpl.newInstance0(Native Method)
08:47:08,390 INFO [STDOUT] at sun.reflect.NativeConstructorAccessorImpl.newInstance(NativeConstructorAccessorImpl.java:39)
08:47:08,390 INFO [STDOUT] at sun.reflect.DelegatingConstructorAccessorImpl.newInstance(DelegatingConstructorAccessorImpl.java:27)
08:47:08,390 INFO [STDOUT] at java.lang.reflect.Constructor.newInstance(Constructor.java:513)
08:47:08,390 INFO [STDOUT] at com.mysql.jdbc.Util.handleNewInstance(Util.java:411)
08:47:08,390 INFO [STDOUT] at com.mysql.jdbc.Util.getInstance(Util.java:386)
08:47:08,390 INFO [STDOUT] at com.mysql.jdbc.SQLError.createSQLException(SQLError.java:1013)
08:47:08,391 INFO [STDOUT] at com.mysql.jdbc.SQLError.createSQLException(SQLError.java:987)
08:47:08,391 INFO [STDOUT] at com.mysql.jdbc.SQLError.createSQLException(SQLError.java:982)
08:47:08,391 INFO [STDOUT] at com.mysql.jdbc.SQLError.createSQLException(SQLError.java:927)
08:47:08,391 INFO [STDOUT] at com.mysql.jdbc.ConnectionImpl.throwConnectionClosedException(ConnectionImpl.java:1206)
08:47:08,391 INFO [STDOUT] at com.mysql.jdbc.ConnectionImpl.checkClosed(ConnectionImpl.java:1198)
08:47:08,391 INFO [STDOUT] at com.mysql.jdbc.ConnectionImpl.commit(ConnectionImpl.java:1625)
08:47:08,391 INFO [STDOUT] at com.mchange.v2.c3p0.impl.NewProxyConnection.commit(NewProxyConnection.java:803)
08:47:08,392 INFO [STDOUT] at org.hibernate.transaction.JDBCTransaction.commitAndResetAutoCommit(JDBCTransaction.java:166)
08:47:08,392 INFO [STDOUT] at org.hibernate.transaction.JDBCTransaction.commit(JDBCTransaction.java:142)
08:47:08,392 INFO [STDOUT] ... 5 more
08:47:08,392 INFO [STDOUT] 08:47:08,383 ERROR EntityConsumerLuceneworkProducer:103 - error during batch indexing:
08:47:08,393 INFO [STDOUT] org.hibernate.TransactionException: JDBC commit failed
08:47:08,393 INFO [STDOUT] at org.hibernate.transaction.JDBCTransaction.commit(JDBCTransaction.java:157)
08:47:08,393 INFO [STDOUT] at org.hibernate.search.batchindexing.EntityConsumerLuceneworkProducer.run(EntityConsumerLuceneworkProducer.java:100)
08:47:08,393 INFO [STDOUT] at org.hibernate.search.batchindexing.OptionallyWrapInJTATransaction.run(OptionallyWrapInJTATransaction.java:107)
08:47:08,393 INFO [STDOUT] at java.util.concurrent.ThreadPoolExecutor$Worker.runTask(ThreadPoolExecutor.java:895)
08:47:08,393 INFO [STDOUT] at java.util.concurrent.ThreadPoolExecutor$Worker.run(ThreadPoolExecutor.java:918)
08:47:08,394 INFO [STDOUT] at java.lang.Thread.run(Thread.java:662)
08:47:08,394 INFO [STDOUT] Caused by: com.mysql.jdbc.exceptions.jdbc4.MySQLNonTransientConnectionException: No operations allowed after connection closed.
08:47:08,394 INFO [STDOUT] at sun.reflect.NativeConstructorAccessorImpl.newInstance0(Native Method)
08:47:08,394 INFO [STDOUT] at sun.reflect.NativeConstructorAccessorImpl.newInstance(NativeConstructorAccessorImpl.java:39)
08:47:08,394 INFO [STDOUT] at sun.reflect.DelegatingConstructorAccessorImpl.newInstance(DelegatingConstructorAccessorImpl.java:27)
08:47:08,394 INFO [STDOUT] at java.lang.reflect.Constructor.newInstance(Constructor.java:513)
08:47:08,394 INFO [STDOUT] at com.mysql.jdbc.Util.handleNewInstance(Util.java:411)
08:47:08,394 INFO [STDOUT] at com.mysql.jdbc.Util.getInstance(Util.java:386)
08:47:08,395 INFO [STDOUT] at com.mysql.jdbc.SQLError.createSQLException(SQLError.java:1013)
08:47:08,395 INFO [STDOUT] at com.mysql.jdbc.SQLError.createSQLException(SQLError.java:987)
08:47:08,395 INFO [STDOUT] at com.mysql.jdbc.SQLError.createSQLException(SQLError.java:982)
08:47:08,395 INFO [STDOUT] at com.mysql.jdbc.SQLError.createSQLException(SQLError.java:927)
08:47:08,395 INFO [STDOUT] at com.mysql.jdbc.ConnectionImpl.throwConnectionClosedException(ConnectionImpl.java:1206)
08:47:08,395 INFO [STDOUT] at com.mysql.jdbc.ConnectionImpl.checkClosed(ConnectionImpl.java:1198)
08:47:08,395 INFO [STDOUT] at com.mysql.jdbc.ConnectionImpl.commit(ConnectionImpl.java:1625)
08:47:08,396 INFO [STDOUT] at com.mchange.v2.c3p0.impl.NewProxyConnection.commit(NewProxyConnection.java:803)
08:47:08,396 INFO [STDOUT] at org.hibernate.transaction.JDBCTransaction.commitAndResetAutoCommit(JDBCTransaction.java:166)
08:47:08,396 INFO [STDOUT] at org.hibernate.transaction.JDBCTransaction.commit(JDBCTransaction.java:142)
08:47:08,396 INFO [STDOUT] ... 5 more
08:47:11,707 INFO [STDOUT] 08:47:11,706 INFO SimpleIndexingProgressMonitor:88 - Reindexed 218402 entities
08:47:11,710 INFO [STDOUT] 08:47:11,708 ERROR JDBCTransaction:151 - JDBC commit failed
08:47:11,710 INFO [STDOUT] com.mysql.jdbc.exceptions.jdbc4.MySQLNonTransientConnectionException: No operations allowed after connection closed.
08:47:11,710 INFO [STDOUT] at sun.reflect.NativeConstructorAccessorImpl.newInstance0(Native Method)
08:47:11,711 INFO [STDOUT] at sun.reflect.NativeConstructorAccessorImpl.newInstance(NativeConstructorAccessorImpl.java:39)
08:47:11,711 INFO [STDOUT] at sun.reflect.DelegatingConstructorAccessorImpl.newInstance(DelegatingConstructorAccessorImpl.java:27)
08:47:11,711 INFO [STDOUT] at java.lang.reflect.Constructor.newInstance(Constructor.java:513)
08:47:11,711 INFO [STDOUT] at com.mysql.jdbc.Util.handleNewInstance(Util.java:411)
08:47:11,711 INFO [STDOUT] at com.mysql.jdbc.Util.getInstance(Util.java:386)
08:47:11,711 INFO [STDOUT] at com.mysql.jdbc.SQLError.createSQLException(SQLError.java:1013)
08:47:11,712 INFO [STDOUT] at com.mysql.jdbc.SQLError.createSQLException(SQLError.java:987)
08:47:11,712 INFO [STDOUT] at com.mysql.jdbc.SQLError.createSQLException(SQLError.java:982)
08:47:11,712 INFO [STDOUT] at com.mysql.jdbc.SQLError.createSQLException(SQLError.java:927)
08:47:11,712 INFO [STDOUT] at com.mysql.jdbc.ConnectionImpl.throwConnectionClosedException(ConnectionImpl.java:1206)
08:47:11,712 INFO [STDOUT] at com.mysql.jdbc.ConnectionImpl.checkClosed(ConnectionImpl.java:1198)
08:47:11,712 INFO [STDOUT] at com.mysql.jdbc.ConnectionImpl.commit(ConnectionImpl.java:1625)
08:47:11,713 INFO [STDOUT] at com.mchange.v2.c3p0.impl.NewProxyConnection.commit(NewProxyConnection.java:803)
08:47:11,713 INFO [STDOUT] at org.hibernate.transaction.JDBCTransaction.commitAndResetAutoCommit(JDBCTransaction.java:166)
08:47:11,713 INFO [STDOUT] at org.hibernate.transaction.JDBCTransaction.commit(JDBCTransaction.java:142)
08:47:11,713 INFO [STDOUT] at app.dao.AbstractDAO.initiateLuceneFullReindex(AbstractDAO.java:218)
08:47:11,713 INFO [STDOUT] at app.services.HotelManager.initiateReindex(HotelManager.java:146)
08:47:11,713 INFO [STDOUT] at WICKET_app.services.HotelManager$$FastClassByCGLIB$$e65ccd9e.invoke(<generated>)
08:47:11,714 INFO [STDOUT] at net.sf.cglib.proxy.MethodProxy.invoke(MethodProxy.java:191)
08:47:11,714 INFO [STDOUT] at org.apache.wicket.proxy.LazyInitProxyFactory$CGLibInterceptor.intercept(LazyInitProxyFactory.java:333)
08:47:11,714 INFO [STDOUT] at WICKET_app.services.HotelManager$$EnhancerByCGLIB$$1b4b869d.initiateReindex(<generated>)
08:47:11,714 INFO [STDOUT] at app.web.pages.admin.AddUpdateStaticData$11.onClick(AddUpdateStaticData.java:254)
08:47:11,714 INFO [STDOUT] at org.apache.wicket.ajax.markup.html.AjaxLink$1.onEvent(AjaxLink.java:86)
08:47:11,714 INFO [STDOUT] at org.apache.wicket.ajax.AjaxEventBehavior.respond(AjaxEventBehavior.java:123)
08:47:11,714 INFO [STDOUT] at org.apache.wicket.ajax.AbstractDefaultAjaxBehavior.onRequest(AbstractDefaultAjaxBehavior.java:633)
08:47:11,715 INFO [STDOUT] at sun.reflect.NativeMethodAccessorImpl.invoke0(Native Method)
08:47:11,715 INFO [STDOUT] at sun.reflect.NativeMethodAccessorImpl.invoke(NativeMethodAccessorImpl.java:39)
08:47:11,715 INFO [STDOUT] at sun.reflect.DelegatingMethodAccessorImpl.invoke(DelegatingMethodAccessorImpl.java:25)
08:47:11,715 INFO [STDOUT] at java.lang.reflect.Method.invoke(Method.java:597)
08:47:11,715 INFO [STDOUT] at org.apache.wicket.RequestListenerInterface.internalInvoke(RequestListenerInterface.java:258)
08:47:11,716 INFO [STDOUT] at org.apache.wicket.RequestListenerInterface.invoke(RequestListenerInterface.java:241)
08:47:11,716 INFO [STDOUT] at org.apache.wicket.core.request.handler.ListenerInterfaceRequestHandler.invokeListener(ListenerInterfaceRequestHandler.java:250)
08:47:11,716 INFO [STDOUT] at org.apache.wicket.core.request.handler.ListenerInterfaceRequestHandler.respond(ListenerInterfaceRequestHandler.java:236)
08:47:11,716 INFO [STDOUT] at org.apache.wicket.request.cycle.RequestCycle$HandlerExecutor.respond(RequestCycle.java:862)
08:47:11,716 INFO [STDOUT] at org.apache.wicket.request.RequestHandlerStack.execute(RequestHandlerStack.java:64)
08:47:11,716 INFO [STDOUT] at org.apache.wicket.request.cycle.RequestCycle.execute(RequestCycle.java:261)
08:47:11,717 INFO [STDOUT] at org.apache.wicket.request.cycle.RequestCycle.processRequest(RequestCycle.java:218)
08:47:11,717 INFO [STDOUT] at org.apache.wicket.request.cycle.RequestCycle.processRequestAndDetach(RequestCycle.java:289)
08:47:11,717 INFO [STDOUT] at org.apache.wicket.protocol.http.WicketFilter.processRequestCycle(WicketFilter.java:259)
08:47:11,717 INFO [STDOUT] at org.apache.wicket.protocol.http.WicketFilter.processRequest(WicketFilter.java:201)
08:47:11,717 INFO [STDOUT] at org.apache.wicket.protocol.http.WicketFilter.doFilter(WicketFilter.java:282)
08:47:11,717 INFO [STDOUT] at org.apache.catalina.core.ApplicationFilterChain.internalDoFilter(ApplicationFilterChain.java:274)
08:47:11,718 INFO [STDOUT] at org.apache.catalina.core.ApplicationFilterChain.doFilter(ApplicationFilterChain.java:242)
08:47:11,718 INFO [STDOUT] at org.springframework.orm.hibernate3.support.OpenSessionInViewFilter.doFilterInternal(OpenSessionInViewFilter.java:198)
08:47:11,718 INFO [STDOUT] at org.springframework.web.filter.OncePerRequestFilter.doFilter(OncePerRequestFilter.java:76)
08:47:11,718 INFO [STDOUT] at org.apache.catalina.core.ApplicationFilterChain.internalDoFilter(ApplicationFilterChain.java:274)
08:47:11,718 INFO [STDOUT] at org.apache.catalina.core.ApplicationFilterChain.doFilter(ApplicationFilterChain.java:242)
08:47:11,718 INFO [STDOUT] at org.apache.catalina.core.StandardWrapperValve.invoke(StandardWrapperValve.java:275)
08:47:11,719 INFO [STDOUT] at org.apache.catalina.core.StandardContextValve.invoke(StandardContextValve.java:191)
08:47:11,719 INFO [STDOUT] at org.jboss.web.tomcat.security.JaccContextValve.invoke(JaccContextValve.java:88)
08:47:11,719 INFO [STDOUT] at org.jboss.web.tomcat.security.SecurityContextEstablishmentValve.invoke(SecurityContextEstablishmentValve.java:100)
08:47:11,719 INFO [STDOUT] at org.apache.catalina.core.StandardHostValve.invoke(StandardHostValve.java:127)
08:47:11,719 INFO [STDOUT] at org.apache.catalina.valves.ErrorReportValve.invoke(ErrorReportValve.java:102)
08:47:11,719 INFO [STDOUT] at org.apache.catalina.core.StandardEngineValve.invoke(StandardEngineValve.java:109)
08:47:11,720 INFO [STDOUT] at org.jboss.web.tomcat.service.request.ActiveRequestResponseCacheValve.invoke(ActiveRequestResponseCacheValve.java:53)
08:47:11,720 INFO [STDOUT] at org.apache.catalina.connector.CoyoteAdapter.service(CoyoteAdapter.java:362)
08:47:11,720 INFO [STDOUT] at org.apache.coyote.http11.Http11Processor.process(Http11Processor.java:877)
08:47:11,720 INFO [STDOUT] at org.apache.coyote.http11.Http11Protocol$Http11ConnectionHandler.process(Http11Protocol.java:654)
08:47:11,720 INFO [STDOUT] at org.apache.tomcat.util.net.JIoEndpoint$Worker.run(JIoEndpoint.java:951)
08:47:11,720 INFO [STDOUT] at java.lang.Thread.run(Thread.java:662)