You are not logged in.
I decide to completely reinstall ReportServer and now it's not working. I downloaded the installer again from Sourceforge.
Has something changed? I noticed SourceForge indicates there was a modification within the last 12 hours but all of the files appear to be unchanged. This is frustrating.
Jan 28, 2015 11:18:43 PM org.apache.catalina.core.AprLifecycleListener init
INFO: Loaded APR based Apache Tomcat Native library 1.1.27 using APR version 1.4.6.
Jan 28, 2015 11:18:43 PM org.apache.catalina.core.AprLifecycleListener init
INFO: APR capabilities: IPv6 [true], sendfile [true], accept filters [false], random [true].
Jan 28, 2015 11:18:44 PM org.apache.catalina.core.AprLifecycleListener initializeSSL
INFO: OpenSSL successfully initialized (OpenSSL 1.0.1d 5 Feb 2013)
Jan 28, 2015 11:18:44 PM org.apache.coyote.AbstractProtocol init
INFO: Initializing ProtocolHandler ["http-apr-8080"]
Jan 28, 2015 11:18:44 PM org.apache.coyote.AbstractProtocol init
INFO: Initializing ProtocolHandler ["ajp-apr-8009"]
Jan 28, 2015 11:18:44 PM org.apache.catalina.startup.Catalina load
INFO: Initialization processed in 2068 ms
Jan 28, 2015 11:18:44 PM org.apache.catalina.core.StandardService startInternal
INFO: Starting service Catalina
Jan 28, 2015 11:18:44 PM org.apache.catalina.core.StandardEngine startInternal
INFO: Starting Servlet Engine: Apache Tomcat/7.0.39
Jan 28, 2015 11:18:44 PM org.apache.catalina.startup.HostConfig deployDirectory
INFO: Deploying web application directory C:\Program Files\reportserver\tomcat\webapps\docs
Jan 28, 2015 11:18:45 PM org.apache.catalina.util.SessionIdGenerator createSecureRandom
INFO: Creation of SecureRandom instance for session ID generation using [SHA1PRNG] took [584] milliseconds.
Jan 28, 2015 11:18:45 PM org.apache.catalina.startup.HostConfig deployDirectory
INFO: Deploying web application directory C:\Program Files\reportserver\tomcat\webapps\examples
Jan 28, 2015 11:18:46 PM org.apache.catalina.startup.HostConfig deployDirectory
INFO: Deploying web application directory C:\Program Files\reportserver\tomcat\webapps\host-manager
Jan 28, 2015 11:18:46 PM org.apache.catalina.startup.HostConfig deployDirectory
INFO: Deploying web application directory C:\Program Files\reportserver\tomcat\webapps\manager
Jan 28, 2015 11:18:46 PM org.apache.catalina.startup.HostConfig deployDirectory
INFO: Deploying web application directory C:\Program Files\reportserver\tomcat\webapps\reportserver
Jan 28, 2015 11:19:26 PM com.google.inject.internal.ProxyFactory <init>
WARNING: Method [public net.datenwerke.gxtdto.client.model.DwModel net.datenwerke.rs.core.server.reportexecutor.ReportExecutorRpcServiceImpl.storePNGInSession(net.datenwerke.rs.core.client.reportmanager.dto.reports.ReportDto) throws net.datenwerke.gxtdto.client.servercommunication.exceptions.ServerCallFailedException] is synthetic and is being intercepted by [net.datenwerke.gf.service.gwtstacktrace.CatchStacktraceInterceptor@7d8467df]. This could indicate a bug. The method may be intercepted twice, or may not be intercepted at all.
Jan 28, 2015 11:19:26 PM com.google.inject.internal.ProxyFactory <init>
WARNING: Method [public net.datenwerke.gxtdto.client.model.DwModel net.datenwerke.rs.core.server.reportexecutor.ReportExecutorRpcServiceImpl.storePNGInSession(net.datenwerke.rs.core.client.reportmanager.dto.reports.ReportDto) throws net.datenwerke.gxtdto.client.servercommunication.exceptions.ServerCallFailedException] is synthetic and is being intercepted by [net.datenwerke.security.service.security.aop.SecurityCheckInterceptor@44eb89e6]. This could indicate a bug. The method may be intercepted twice, or may not be intercepted at all.
Jan 28, 2015 11:19:26 PM net.datenwerke.rs.core.service.i18ntools.RemoteMessageServiceImpl <init>
INFO: Loading messages...
Jan 28, 2015 11:19:35 PM net.datenwerke.rs.core.service.i18ntools.RemoteMessageServiceImpl loadMessageFiles
INFO: remove locale stubs: , zh, ca, tr, no, pt_BR, el_GR, pt_PT, ko, cn, ua, ru, ja
Jan 28, 2015 11:19:35 PM net.datenwerke.rs.core.service.i18ntools.RemoteMessageServiceImpl <init>
INFO: Available locales: hr, ro, hu, lv, lt, ga, de, fi, sv, fr, bg, sl, sk, da, it, keys, mt, cs, el, pt, pl, en, et, es, nl
Jan 28, 2015 11:19:35 PM net.datenwerke.rs.installation.ExecutePackagedScriptsTask execute
INFO: Executing package scripts from: C:\Program Files\reportserver\tomcat\webapps\reportserver\pkg
Jan 28, 2015 11:19:35 PM net.datenwerke.rs.installation.ExecutePackagedScriptsTask execute
INFO: Executing package: C:\Program Files\reportserver\tomcat\webapps\reportserver\pkg\baseconfig-RS2.2.1-5602-2014-12-17-20-23-49.zip
Jan 28, 2015 11:19:36 PM com.sun.jersey.guice.spi.container.GuiceComponentProviderFactory register
INFO: Registering net.datenwerke.rs.saiku.server.rest.resources.BasicRepositoryResource as a root resource class
Jan 28, 2015 11:19:36 PM com.sun.jersey.guice.spi.container.GuiceComponentProviderFactory register
INFO: Registering net.datenwerke.rs.saiku.server.rest.resources.BasicRepositoryResource2 as a root resource class
Jan 28, 2015 11:19:36 PM com.sun.jersey.guice.spi.container.GuiceComponentProviderFactory register
INFO: Registering net.datenwerke.rs.saiku.server.rest.resources.BasicTagRepositoryResource as a root resource class
Jan 28, 2015 11:19:36 PM com.sun.jersey.guice.spi.container.GuiceComponentProviderFactory register
INFO: Registering net.datenwerke.rs.saiku.server.rest.resources.DataSourceResource as a root resource class
Jan 28, 2015 11:19:36 PM com.sun.jersey.guice.spi.container.GuiceComponentProviderFactory register
INFO: Registering net.datenwerke.rs.saiku.server.rest.resources.ExporterResource as a root resource class
Jan 28, 2015 11:19:36 PM com.sun.jersey.guice.spi.container.GuiceComponentProviderFactory register
INFO: Registering net.datenwerke.rs.saiku.server.rest.resources.OlapDiscoverResource as a root resource class
Jan 28, 2015 11:19:36 PM com.sun.jersey.guice.spi.container.GuiceComponentProviderFactory register
INFO: Registering net.datenwerke.rs.saiku.server.rest.resources.QueryResource as a root resource class
Jan 28, 2015 11:19:36 PM com.sun.jersey.guice.spi.container.GuiceComponentProviderFactory register
INFO: Registering net.datenwerke.rs.saiku.server.rest.resources.SessionResource as a root resource class
Jan 28, 2015 11:19:36 PM com.sun.jersey.guice.spi.container.GuiceComponentProviderFactory register
INFO: Registering net.datenwerke.rs.saiku.server.rest.resources.StatisticsResource as a root resource class
Jan 28, 2015 11:19:36 PM com.sun.jersey.guice.spi.container.GuiceComponentProviderFactory register
INFO: Registering net.datenwerke.rs.saiku.server.rest.resources.SaikuI18nResource as a root resource class
Jan 28, 2015 11:19:36 PM com.sun.jersey.server.impl.application.WebApplicationImpl _initiate
INFO: Initiating Jersey application, version 'Jersey: 1.18.1 02/19/2014 03:28 AM'
Jan 28, 2015 11:19:38 PM com.sun.jersey.guice.spi.container.GuiceComponentProviderFactory getComponentProvider
INFO: Binding net.datenwerke.rs.saiku.server.rest.resources.BasicRepositoryResource to GuiceManagedComponentProvider with the scope "PerRequest"
Jan 28, 2015 11:19:38 PM com.sun.jersey.guice.spi.container.GuiceComponentProviderFactory getComponentProvider
INFO: Binding net.datenwerke.rs.saiku.server.rest.resources.BasicRepositoryResource2 to GuiceManagedComponentProvider with the scope "PerRequest"
Jan 28, 2015 11:19:38 PM com.sun.jersey.guice.spi.container.GuiceComponentProviderFactory getComponentProvider
INFO: Binding net.datenwerke.rs.saiku.server.rest.resources.BasicTagRepositoryResource to GuiceManagedComponentProvider with the scope "PerRequest"
Jan 28, 2015 11:19:38 PM com.sun.jersey.guice.spi.container.GuiceComponentProviderFactory getComponentProvider
INFO: Binding net.datenwerke.rs.saiku.server.rest.resources.DataSourceResource to GuiceManagedComponentProvider with the scope "PerRequest"
Jan 28, 2015 11:19:38 PM com.sun.jersey.guice.spi.container.GuiceComponentProviderFactory getComponentProvider
INFO: Binding net.datenwerke.rs.saiku.server.rest.resources.ExporterResource to GuiceManagedComponentProvider with the scope "PerRequest"
Jan 28, 2015 11:19:38 PM com.sun.jersey.guice.spi.container.GuiceComponentProviderFactory getComponentProvider
INFO: Binding net.datenwerke.rs.saiku.server.rest.resources.OlapDiscoverResource to GuiceManagedComponentProvider with the scope "PerRequest"
Jan 28, 2015 11:19:38 PM com.sun.jersey.guice.spi.container.GuiceComponentProviderFactory getComponentProvider
INFO: Binding net.datenwerke.rs.saiku.server.rest.resources.QueryResource to GuiceManagedComponentProvider with the scope "PerRequest"
Jan 28, 2015 11:19:38 PM com.sun.jersey.guice.spi.container.GuiceComponentProviderFactory getComponentProvider
INFO: Binding net.datenwerke.rs.saiku.server.rest.resources.SessionResource to GuiceManagedComponentProvider with the scope "Singleton"
Jan 28, 2015 11:19:38 PM com.sun.jersey.guice.spi.container.GuiceComponentProviderFactory getComponentProvider
INFO: Binding net.datenwerke.rs.saiku.server.rest.resources.StatisticsResource to GuiceManagedComponentProvider with the scope "PerRequest"
Jan 28, 2015 11:19:38 PM com.sun.jersey.guice.spi.container.GuiceComponentProviderFactory getComponentProvider
INFO: Binding net.datenwerke.rs.saiku.server.rest.resources.SaikuI18nResource to GuiceManagedComponentProvider with the scope "PerRequest"
Jan 28, 2015 11:19:38 PM org.apache.catalina.startup.HostConfig deployDirectory
INFO: Deploying web application directory C:\Program Files\reportserver\tomcat\webapps\ROOT
Jan 28, 2015 11:19:38 PM org.apache.coyote.AbstractProtocol start
INFO: Starting ProtocolHandler ["http-apr-8080"]
Jan 28, 2015 11:19:38 PM org.apache.coyote.AbstractProtocol start
INFO: Starting ProtocolHandler ["ajp-apr-8009"]
Jan 28, 2015 11:19:38 PM org.apache.catalina.startup.Catalina start
INFO: Server startup in 53581 ms
Jan 28, 2015 11:19:42 PM net.datenwerke.rs.core.service.jarextension.hookers.ReportServerExtenderHooker initialize
INFO: Start loading ReportServer extensions.
Jan 28, 2015 11:19:42 PM net.datenwerke.rs.core.service.internaldb.InternalDbServiceImpl getLocation
WARNING: Cannot write to internal db file: C:\Program Files\reportserver\tomcat\bin\dbtmp
Jan 28, 2015 11:19:43 PM net.datenwerke.rs.core.service.internaldb.InternalDbServiceImpl getLocation
WARNING: Fallback location internaldb: C:\Program Files\reportserver\tomcat\temp
Jan 28, 2015 11:19:43 PM net.datenwerke.rs.core.service.internaldb.InternalDbServiceImpl getLocation
WARNING: Cannot write to internal db file: C:\Program Files\reportserver\tomcat\bin\dbtmp
Jan 28, 2015 11:19:43 PM net.datenwerke.rs.core.service.internaldb.InternalDbServiceImpl getLocation
WARNING: Fallback location internaldb: C:\Program Files\reportserver\tomcat\temp
Jan 28, 2015 11:19:43 PM net.datenwerke.rs.core.service.internaldb.InternalDbServiceImpl getLocation
WARNING: Cannot write to internal db file: C:\Program Files\reportserver\tomcat\bin\dbtmp
Jan 28, 2015 11:19:43 PM net.datenwerke.rs.core.service.internaldb.InternalDbServiceImpl getLocation
WARNING: Fallback location internaldb: C:\Program Files\reportserver\tomcat\temp
Jan 28, 2015 11:19:43 PM net.datenwerke.rs.core.service.internaldb.InternalDbServiceImpl getLocation
WARNING: Cannot write to internal db file: C:\Program Files\reportserver\tomcat\bin\dbtmp
Jan 28, 2015 11:19:43 PM net.datenwerke.rs.core.service.internaldb.InternalDbServiceImpl getLocation
WARNING: Fallback location internaldb: C:\Program Files\reportserver\tomcat\temp
Jan 28, 2015 11:19:43 PM net.datenwerke.rs.core.service.internaldb.InternalDbServiceImpl initDemoDatabase
WARNING: could not init demodata
org.h2.jdbc.JdbcSQLException: General error: "java.lang.IllegalStateException: Unsynchronized metadata read [1.4.180/3]"; SQL statement:
DROP ALL OBJECTS [50000-180]
at org.h2.message.DbException.getJdbcSQLException(DbException.java:345)
at org.h2.message.DbException.get(DbException.java:168)
at org.h2.message.DbException.convert(DbException.java:295)
at org.h2.command.Command.executeUpdate(Command.java:262)
at org.h2.jdbc.JdbcPreparedStatement.execute(JdbcPreparedStatement.java:198)
at net.datenwerke.rs.core.service.internaldb.InternalDbServiceImpl.initDemoDatabase(InternalDbServiceImpl.java:169)
at net.datenwerke.rs.core.service.internaldb.InternalDbStartup$1.initialize(InternalDbStartup.java:35)
at net.datenwerke.gf.service.lateinit.LateInitStartup$1.run(LateInitStartup.java:42)
at java.lang.Thread.run(Unknown Source)
Caused by: java.lang.IllegalStateException: Unsynchronized metadata read [1.4.180/3]
at org.h2.mvstore.DataUtils.newIllegalStateException(DataUtils.java:756)
at org.h2.mvstore.MVStore.getChunkIfFound(MVStore.java:829)
at org.h2.mvstore.MVStore.getChunk(MVStore.java:814)
at org.h2.mvstore.MVStore.readPage(MVStore.java:1860)
at org.h2.mvstore.MVMap.readPage(MVMap.java:767)
at org.h2.mvstore.Page.getChildPage(Page.java:252)
at org.h2.mvstore.MVMap.binarySearch(MVMap.java:467)
at org.h2.mvstore.MVMap.binarySearch(MVMap.java:468)
at org.h2.mvstore.MVMap.get(MVMap.java:449)
at org.h2.mvstore.MVMapConcurrent.remove(MVMapConcurrent.java:71)
at org.h2.store.LobStorageMap.removeLob(LobStorageMap.java:292)
at org.h2.store.LobStorageMap.removeAllForTable(LobStorageMap.java:269)
at org.h2.mvstore.db.MVPrimaryIndex.truncate(MVPrimaryIndex.java:246)
at org.h2.mvstore.db.MVTable.truncate(MVTable.java:607)
at org.h2.mvstore.db.MVTable.removeChildrenAndResources(MVTable.java:710)
at org.h2.engine.Database.removeSchemaObject(Database.java:1784)
at org.h2.command.ddl.DropDatabase.dropAllObjects(DropDatabase.java:87)
at org.h2.command.ddl.DropDatabase.update(DropDatabase.java:36)
at org.h2.command.CommandContainer.update(CommandContainer.java:78)
at org.h2.command.Command.executeUpdate(Command.java:254)
... 5 moreJan 28, 2015 11:19:44 PM net.datenwerke.gf.service.lateinit.LateInitStartup$1 run
SEVERE: Error in LateInitHook
java.lang.IllegalStateException: org.h2.jdbc.JdbcSQLException: General error: "java.lang.IllegalStateException: Unsynchronized metadata read [1.4.180/3]"; SQL statement:
DROP ALL OBJECTS [50000-180]
at net.datenwerke.rs.core.service.internaldb.InternalDbServiceImpl.initDemoDatabase(InternalDbServiceImpl.java:189)
at net.datenwerke.rs.core.service.internaldb.InternalDbStartup$1.initialize(InternalDbStartup.java:35)
at net.datenwerke.gf.service.lateinit.LateInitStartup$1.run(LateInitStartup.java:42)
at java.lang.Thread.run(Unknown Source)
Caused by: org.h2.jdbc.JdbcSQLException: General error: "java.lang.IllegalStateException: Unsynchronized metadata read [1.4.180/3]"; SQL statement:
DROP ALL OBJECTS [50000-180]
at org.h2.message.DbException.getJdbcSQLException(DbException.java:345)
at org.h2.message.DbException.get(DbException.java:168)
at org.h2.message.DbException.convert(DbException.java:295)
at org.h2.command.Command.executeUpdate(Command.java:262)
at org.h2.jdbc.JdbcPreparedStatement.execute(JdbcPreparedStatement.java:198)
at net.datenwerke.rs.core.service.internaldb.InternalDbServiceImpl.initDemoDatabase(InternalDbServiceImpl.java:169)
... 3 more
Caused by: java.lang.IllegalStateException: Unsynchronized metadata read [1.4.180/3]
at org.h2.mvstore.DataUtils.newIllegalStateException(DataUtils.java:756)
at org.h2.mvstore.MVStore.getChunkIfFound(MVStore.java:829)
at org.h2.mvstore.MVStore.getChunk(MVStore.java:814)
at org.h2.mvstore.MVStore.readPage(MVStore.java:1860)
at org.h2.mvstore.MVMap.readPage(MVMap.java:767)
at org.h2.mvstore.Page.getChildPage(Page.java:252)
at org.h2.mvstore.MVMap.binarySearch(MVMap.java:467)
at org.h2.mvstore.MVMap.binarySearch(MVMap.java:468)
at org.h2.mvstore.MVMap.get(MVMap.java:449)
at org.h2.mvstore.MVMapConcurrent.remove(MVMapConcurrent.java:71)
at org.h2.store.LobStorageMap.removeLob(LobStorageMap.java:292)
at org.h2.store.LobStorageMap.removeAllForTable(LobStorageMap.java:269)
at org.h2.mvstore.db.MVPrimaryIndex.truncate(MVPrimaryIndex.java:246)
at org.h2.mvstore.db.MVTable.truncate(MVTable.java:607)
at org.h2.mvstore.db.MVTable.removeChildrenAndResources(MVTable.java:710)
at org.h2.engine.Database.removeSchemaObject(Database.java:1784)
at org.h2.command.ddl.DropDatabase.dropAllObjects(DropDatabase.java:87)
at org.h2.command.ddl.DropDatabase.update(DropDatabase.java:36)
at org.h2.command.CommandContainer.update(CommandContainer.java:78)
at org.h2.command.Command.executeUpdate(Command.java:254)
... 5 more
Last edited by tomharney (2015-01-29 04:24:18)
Offline
Hi Tom,
I've changed some of the metadata on the sourceforge site which they apparently picked up as a "project change". So no, we didn't change
any of the files.
Your stacktrace looks like you have a corrupted H2 database. Could you try the following:
1) stop the server
2) go to reportserver/dbtmp and delete everything in the folder (you should see files like rsdemodb.mv.db
3) start the server
Hope this helps
Arno
Offline
I took those steps and still the same error messages.
This makes absolutely no sense. I simply reinstalled the application. In another post, I'm going to point out a few things I noticed in the logs.
Jan 29, 2015 9:21:29 AM org.apache.catalina.core.AprLifecycleListener init
INFO: Loaded APR based Apache Tomcat Native library 1.1.27 using APR version 1.4.6.
Jan 29, 2015 9:21:29 AM org.apache.catalina.core.AprLifecycleListener init
INFO: APR capabilities: IPv6 [true], sendfile [true], accept filters [false], random [true].
Jan 29, 2015 9:21:30 AM org.apache.catalina.core.AprLifecycleListener initializeSSL
INFO: OpenSSL successfully initialized (OpenSSL 1.0.1d 5 Feb 2013)
Jan 29, 2015 9:21:30 AM org.apache.coyote.AbstractProtocol init
INFO: Initializing ProtocolHandler ["http-apr-8080"]
Jan 29, 2015 9:21:30 AM org.apache.coyote.AbstractProtocol init
INFO: Initializing ProtocolHandler ["ajp-apr-8009"]
Jan 29, 2015 9:21:30 AM org.apache.catalina.startup.Catalina load
INFO: Initialization processed in 1967 ms
Jan 29, 2015 9:21:30 AM org.apache.catalina.core.StandardService startInternal
INFO: Starting service Catalina
Jan 29, 2015 9:21:30 AM org.apache.catalina.core.StandardEngine startInternal
INFO: Starting Servlet Engine: Apache Tomcat/7.0.39
Jan 29, 2015 9:21:30 AM org.apache.catalina.startup.HostConfig deployDirectory
INFO: Deploying web application directory C:\Program Files\reportserver\tomcat\webapps\docs
Jan 29, 2015 9:21:31 AM org.apache.catalina.startup.HostConfig deployDirectory
INFO: Deploying web application directory C:\Program Files\reportserver\tomcat\webapps\examples
Jan 29, 2015 9:21:31 AM org.apache.catalina.startup.HostConfig deployDirectory
INFO: Deploying web application directory C:\Program Files\reportserver\tomcat\webapps\host-manager
Jan 29, 2015 9:21:31 AM org.apache.catalina.startup.HostConfig deployDirectory
INFO: Deploying web application directory C:\Program Files\reportserver\tomcat\webapps\manager
Jan 29, 2015 9:21:31 AM org.apache.catalina.startup.HostConfig deployDirectory
INFO: Deploying web application directory C:\Program Files\reportserver\tomcat\webapps\reportserver
Jan 29, 2015 9:22:14 AM com.google.inject.internal.ProxyFactory <init>
WARNING: Method [public net.datenwerke.gxtdto.client.model.DwModel net.datenwerke.rs.core.server.reportexecutor.ReportExecutorRpcServiceImpl.storePNGInSession(net.datenwerke.rs.core.client.reportmanager.dto.reports.ReportDto) throws net.datenwerke.gxtdto.client.servercommunication.exceptions.ServerCallFailedException] is synthetic and is being intercepted by [net.datenwerke.gf.service.gwtstacktrace.CatchStacktraceInterceptor@7ab4e8d]. This could indicate a bug. The method may be intercepted twice, or may not be intercepted at all.
Jan 29, 2015 9:22:14 AM com.google.inject.internal.ProxyFactory <init>
WARNING: Method [public net.datenwerke.gxtdto.client.model.DwModel net.datenwerke.rs.core.server.reportexecutor.ReportExecutorRpcServiceImpl.storePNGInSession(net.datenwerke.rs.core.client.reportmanager.dto.reports.ReportDto) throws net.datenwerke.gxtdto.client.servercommunication.exceptions.ServerCallFailedException] is synthetic and is being intercepted by [net.datenwerke.security.service.security.aop.SecurityCheckInterceptor@148d24a0]. This could indicate a bug. The method may be intercepted twice, or may not be intercepted at all.
Jan 29, 2015 9:22:15 AM net.datenwerke.rs.core.service.i18ntools.RemoteMessageServiceImpl <init>
INFO: Loading messages...
Jan 29, 2015 9:22:15 AM net.datenwerke.rs.core.service.jarextension.hookers.ReportServerExtenderHooker initialize
INFO: Start loading ReportServer extensions.
Jan 29, 2015 9:22:15 AM net.datenwerke.rs.core.service.internaldb.InternalDbServiceImpl getLocation
WARNING: Cannot write to internal db file: C:\Program Files\reportserver\tomcat\bin\dbtmp
Jan 29, 2015 9:22:15 AM net.datenwerke.rs.core.service.internaldb.InternalDbServiceImpl getLocation
WARNING: Fallback location internaldb: C:\Program Files\reportserver\tomcat\temp
Jan 29, 2015 9:22:15 AM net.datenwerke.rs.core.service.internaldb.InternalDbServiceImpl getLocation
WARNING: Cannot write to internal db file: C:\Program Files\reportserver\tomcat\bin\dbtmp
Jan 29, 2015 9:22:15 AM net.datenwerke.rs.core.service.internaldb.InternalDbServiceImpl getLocation
WARNING: Fallback location internaldb: C:\Program Files\reportserver\tomcat\temp
Jan 29, 2015 9:22:15 AM net.datenwerke.rs.core.service.internaldb.InternalDbServiceImpl getLocation
WARNING: Cannot write to internal db file: C:\Program Files\reportserver\tomcat\bin\dbtmp
Jan 29, 2015 9:22:15 AM net.datenwerke.rs.core.service.internaldb.InternalDbServiceImpl getLocation
WARNING: Fallback location internaldb: C:\Program Files\reportserver\tomcat\temp
Jan 29, 2015 9:22:16 AM net.datenwerke.rs.core.service.internaldb.InternalDbServiceImpl getLocation
WARNING: Cannot write to internal db file: C:\Program Files\reportserver\tomcat\bin\dbtmp
Jan 29, 2015 9:22:16 AM net.datenwerke.rs.core.service.internaldb.InternalDbServiceImpl getLocation
WARNING: Fallback location internaldb: C:\Program Files\reportserver\tomcat\temp
Jan 29, 2015 9:22:16 AM net.datenwerke.rs.core.service.internaldb.InternalDbServiceImpl initDemoDatabase
WARNING: could not init demodata
org.h2.jdbc.JdbcSQLException: General error: "java.lang.IllegalStateException: Unsynchronized metadata read [1.4.180/3]"; SQL statement:
DROP ALL OBJECTS [50000-180]
at org.h2.message.DbException.getJdbcSQLException(DbException.java:345)
at org.h2.message.DbException.get(DbException.java:168)
at org.h2.message.DbException.convert(DbException.java:295)
at org.h2.command.Command.executeUpdate(Command.java:262)
at org.h2.jdbc.JdbcPreparedStatement.execute(JdbcPreparedStatement.java:198)
at net.datenwerke.rs.core.service.internaldb.InternalDbServiceImpl.initDemoDatabase(InternalDbServiceImpl.java:169)
at net.datenwerke.rs.core.service.internaldb.InternalDbStartup$1.initialize(InternalDbStartup.java:35)
at net.datenwerke.gf.service.lateinit.LateInitStartup$1.run(LateInitStartup.java:42)
at java.lang.Thread.run(Unknown Source)
Caused by: java.lang.IllegalStateException: Unsynchronized metadata read [1.4.180/3]
at org.h2.mvstore.DataUtils.newIllegalStateException(DataUtils.java:756)
at org.h2.mvstore.MVStore.getChunkIfFound(MVStore.java:829)
at org.h2.mvstore.MVStore.getChunk(MVStore.java:814)
at org.h2.mvstore.MVStore.readPage(MVStore.java:1860)
at org.h2.mvstore.MVMap.readPage(MVMap.java:767)
at org.h2.mvstore.Page.getChildPage(Page.java:252)
at org.h2.mvstore.MVMap.binarySearch(MVMap.java:467)
at org.h2.mvstore.MVMap.binarySearch(MVMap.java:468)
at org.h2.mvstore.MVMap.get(MVMap.java:449)
at org.h2.mvstore.MVMapConcurrent.remove(MVMapConcurrent.java:71)
at org.h2.store.LobStorageMap.removeLob(LobStorageMap.java:292)
at org.h2.store.LobStorageMap.removeAllForTable(LobStorageMap.java:269)
at org.h2.mvstore.db.MVPrimaryIndex.truncate(MVPrimaryIndex.java:246)
at org.h2.mvstore.db.MVTable.truncate(MVTable.java:607)
at org.h2.mvstore.db.MVTable.removeChildrenAndResources(MVTable.java:710)
at org.h2.engine.Database.removeSchemaObject(Database.java:1784)
at org.h2.command.ddl.DropDatabase.dropAllObjects(DropDatabase.java:87)
at org.h2.command.ddl.DropDatabase.update(DropDatabase.java:36)
at org.h2.command.CommandContainer.update(CommandContainer.java:78)
at org.h2.command.Command.executeUpdate(Command.java:254)
... 5 moreJan 29, 2015 9:22:18 AM net.datenwerke.gf.service.lateinit.LateInitStartup$1 run
SEVERE: Error in LateInitHook
java.lang.IllegalStateException: org.h2.jdbc.JdbcSQLException: General error: "java.lang.IllegalStateException: Unsynchronized metadata read [1.4.180/3]"; SQL statement:
DROP ALL OBJECTS [50000-180]
at net.datenwerke.rs.core.service.internaldb.InternalDbServiceImpl.initDemoDatabase(InternalDbServiceImpl.java:189)
at net.datenwerke.rs.core.service.internaldb.InternalDbStartup$1.initialize(InternalDbStartup.java:35)
at net.datenwerke.gf.service.lateinit.LateInitStartup$1.run(LateInitStartup.java:42)
at java.lang.Thread.run(Unknown Source)
Caused by: org.h2.jdbc.JdbcSQLException: General error: "java.lang.IllegalStateException: Unsynchronized metadata read [1.4.180/3]"; SQL statement:
DROP ALL OBJECTS [50000-180]
at org.h2.message.DbException.getJdbcSQLException(DbException.java:345)
at org.h2.message.DbException.get(DbException.java:168)
at org.h2.message.DbException.convert(DbException.java:295)
at org.h2.command.Command.executeUpdate(Command.java:262)
at org.h2.jdbc.JdbcPreparedStatement.execute(JdbcPreparedStatement.java:198)
at net.datenwerke.rs.core.service.internaldb.InternalDbServiceImpl.initDemoDatabase(InternalDbServiceImpl.java:169)
... 3 more
Caused by: java.lang.IllegalStateException: Unsynchronized metadata read [1.4.180/3]
at org.h2.mvstore.DataUtils.newIllegalStateException(DataUtils.java:756)
at org.h2.mvstore.MVStore.getChunkIfFound(MVStore.java:829)
at org.h2.mvstore.MVStore.getChunk(MVStore.java:814)
at org.h2.mvstore.MVStore.readPage(MVStore.java:1860)
at org.h2.mvstore.MVMap.readPage(MVMap.java:767)
at org.h2.mvstore.Page.getChildPage(Page.java:252)
at org.h2.mvstore.MVMap.binarySearch(MVMap.java:467)
at org.h2.mvstore.MVMap.binarySearch(MVMap.java:468)
at org.h2.mvstore.MVMap.get(MVMap.java:449)
at org.h2.mvstore.MVMapConcurrent.remove(MVMapConcurrent.java:71)
at org.h2.store.LobStorageMap.removeLob(LobStorageMap.java:292)
at org.h2.store.LobStorageMap.removeAllForTable(LobStorageMap.java:269)
at org.h2.mvstore.db.MVPrimaryIndex.truncate(MVPrimaryIndex.java:246)
at org.h2.mvstore.db.MVTable.truncate(MVTable.java:607)
at org.h2.mvstore.db.MVTable.removeChildrenAndResources(MVTable.java:710)
at org.h2.engine.Database.removeSchemaObject(Database.java:1784)
at org.h2.command.ddl.DropDatabase.dropAllObjects(DropDatabase.java:87)
at org.h2.command.ddl.DropDatabase.update(DropDatabase.java:36)
at org.h2.command.CommandContainer.update(CommandContainer.java:78)
at org.h2.command.Command.executeUpdate(Command.java:254)
... 5 moreJan 29, 2015 9:22:27 AM net.datenwerke.rs.core.service.i18ntools.RemoteMessageServiceImpl loadMessageFiles
INFO: remove locale stubs: , no, el_GR, ru, pt_BR, ua, ca, ko, cn, zh, ja, tr, pt_PT
Jan 29, 2015 9:22:27 AM net.datenwerke.rs.core.service.i18ntools.RemoteMessageServiceImpl <init>
INFO: Available locales: de, fi, pt, bg, keys, lt, hr, lv, fr, hu, sk, sl, ga, sv, el, mt, en, it, es, et, cs, pl, da, ro, nl
Jan 29, 2015 9:22:28 AM com.sun.jersey.guice.spi.container.GuiceComponentProviderFactory register
INFO: Registering net.datenwerke.rs.saiku.server.rest.resources.BasicRepositoryResource as a root resource class
Jan 29, 2015 9:22:28 AM com.sun.jersey.guice.spi.container.GuiceComponentProviderFactory register
INFO: Registering net.datenwerke.rs.saiku.server.rest.resources.BasicRepositoryResource2 as a root resource class
Jan 29, 2015 9:22:28 AM com.sun.jersey.guice.spi.container.GuiceComponentProviderFactory register
INFO: Registering net.datenwerke.rs.saiku.server.rest.resources.BasicTagRepositoryResource as a root resource class
Jan 29, 2015 9:22:28 AM com.sun.jersey.guice.spi.container.GuiceComponentProviderFactory register
INFO: Registering net.datenwerke.rs.saiku.server.rest.resources.DataSourceResource as a root resource class
Jan 29, 2015 9:22:28 AM com.sun.jersey.guice.spi.container.GuiceComponentProviderFactory register
INFO: Registering net.datenwerke.rs.saiku.server.rest.resources.ExporterResource as a root resource class
Jan 29, 2015 9:22:28 AM com.sun.jersey.guice.spi.container.GuiceComponentProviderFactory register
INFO: Registering net.datenwerke.rs.saiku.server.rest.resources.OlapDiscoverResource as a root resource class
Jan 29, 2015 9:22:28 AM com.sun.jersey.guice.spi.container.GuiceComponentProviderFactory register
INFO: Registering net.datenwerke.rs.saiku.server.rest.resources.QueryResource as a root resource class
Jan 29, 2015 9:22:28 AM com.sun.jersey.guice.spi.container.GuiceComponentProviderFactory register
INFO: Registering net.datenwerke.rs.saiku.server.rest.resources.SessionResource as a root resource class
Jan 29, 2015 9:22:28 AM com.sun.jersey.guice.spi.container.GuiceComponentProviderFactory register
INFO: Registering net.datenwerke.rs.saiku.server.rest.resources.StatisticsResource as a root resource class
Jan 29, 2015 9:22:28 AM com.sun.jersey.guice.spi.container.GuiceComponentProviderFactory register
INFO: Registering net.datenwerke.rs.saiku.server.rest.resources.SaikuI18nResource as a root resource class
Jan 29, 2015 9:22:28 AM com.sun.jersey.server.impl.application.WebApplicationImpl _initiate
INFO: Initiating Jersey application, version 'Jersey: 1.18.1 02/19/2014 03:28 AM'
Jan 29, 2015 9:22:29 AM com.sun.jersey.guice.spi.container.GuiceComponentProviderFactory getComponentProvider
INFO: Binding net.datenwerke.rs.saiku.server.rest.resources.BasicRepositoryResource to GuiceManagedComponentProvider with the scope "PerRequest"
Jan 29, 2015 9:22:29 AM com.sun.jersey.guice.spi.container.GuiceComponentProviderFactory getComponentProvider
INFO: Binding net.datenwerke.rs.saiku.server.rest.resources.BasicRepositoryResource2 to GuiceManagedComponentProvider with the scope "PerRequest"
Jan 29, 2015 9:22:29 AM com.sun.jersey.guice.spi.container.GuiceComponentProviderFactory getComponentProvider
INFO: Binding net.datenwerke.rs.saiku.server.rest.resources.BasicTagRepositoryResource to GuiceManagedComponentProvider with the scope "PerRequest"
Jan 29, 2015 9:22:29 AM com.sun.jersey.guice.spi.container.GuiceComponentProviderFactory getComponentProvider
INFO: Binding net.datenwerke.rs.saiku.server.rest.resources.DataSourceResource to GuiceManagedComponentProvider with the scope "PerRequest"
Jan 29, 2015 9:22:29 AM com.sun.jersey.guice.spi.container.GuiceComponentProviderFactory getComponentProvider
INFO: Binding net.datenwerke.rs.saiku.server.rest.resources.ExporterResource to GuiceManagedComponentProvider with the scope "PerRequest"
Jan 29, 2015 9:22:29 AM com.sun.jersey.guice.spi.container.GuiceComponentProviderFactory getComponentProvider
INFO: Binding net.datenwerke.rs.saiku.server.rest.resources.OlapDiscoverResource to GuiceManagedComponentProvider with the scope "PerRequest"
Jan 29, 2015 9:22:29 AM com.sun.jersey.guice.spi.container.GuiceComponentProviderFactory getComponentProvider
INFO: Binding net.datenwerke.rs.saiku.server.rest.resources.QueryResource to GuiceManagedComponentProvider with the scope "PerRequest"
Jan 29, 2015 9:22:29 AM com.sun.jersey.guice.spi.container.GuiceComponentProviderFactory getComponentProvider
INFO: Binding net.datenwerke.rs.saiku.server.rest.resources.SessionResource to GuiceManagedComponentProvider with the scope "Singleton"
Jan 29, 2015 9:22:29 AM com.sun.jersey.guice.spi.container.GuiceComponentProviderFactory getComponentProvider
INFO: Binding net.datenwerke.rs.saiku.server.rest.resources.StatisticsResource to GuiceManagedComponentProvider with the scope "PerRequest"
Jan 29, 2015 9:22:29 AM com.sun.jersey.guice.spi.container.GuiceComponentProviderFactory getComponentProvider
INFO: Binding net.datenwerke.rs.saiku.server.rest.resources.SaikuI18nResource to GuiceManagedComponentProvider with the scope "PerRequest"
Jan 29, 2015 9:22:29 AM org.apache.catalina.startup.HostConfig deployDirectory
INFO: Deploying web application directory C:\Program Files\reportserver\tomcat\webapps\ROOT
Jan 29, 2015 9:22:29 AM org.apache.coyote.AbstractProtocol start
INFO: Starting ProtocolHandler ["http-apr-8080"]
Jan 29, 2015 9:22:29 AM org.apache.coyote.AbstractProtocol start
INFO: Starting ProtocolHandler ["ajp-apr-8009"]
Jan 29, 2015 9:22:29 AM org.apache.catalina.startup.Catalina start
INFO: Server startup in 58977 ms
Offline
What is this all about? I thought the path was C:\Program Files\reportserver\tomcat\webapps\reportserver\dbtmp
Could the origin of this problem lie in recent Java update?
I've been searching the various configuration files looking for the dbtmp path. Where is this path set?
INFO: Start loading ReportServer extensions.
Jan 29, 2015 9:22:15 AM net.datenwerke.rs.core.service.internaldb.InternalDbServiceImpl getLocation
WARNING: Cannot write to internal db file: C:\Program Files\reportserver\tomcat\bin\dbtmp
Jan 29, 2015 9:22:15 AM net.datenwerke.rs.core.service.internaldb.InternalDbServiceImpl getLocation
WARNING: Fallback location internaldb: C:\Program Files\reportserver\tomcat\temp
Jan 29, 2015 9:22:15 AM net.datenwerke.rs.core.service.internaldb.InternalDbServiceImpl getLocation
WARNING: Cannot write to internal db file: C:\Program Files\reportserver\tomcat\bin\dbtmp
Jan 29, 2015 9:22:15 AM net.datenwerke.rs.core.service.internaldb.InternalDbServiceImpl getLocation
WARNING: Fallback location internaldb: C:\Program Files\reportserver\tomcat\temp
Jan 29, 2015 9:22:15 AM net.datenwerke.rs.core.service.internaldb.InternalDbServiceImpl getLocation
WARNING: Cannot write to internal db file: C:\Program Files\reportserver\tomcat\bin\dbtmp
Jan 29, 2015 9:22:15 AM net.datenwerke.rs.core.service.internaldb.InternalDbServiceImpl getLocation
WARNING: Fallback location internaldb: C:\Program Files\reportserver\tomcat\temp
Jan 29, 2015 9:22:16 AM net.datenwerke.rs.core.service.internaldb.InternalDbServiceImpl getLocation
WARNING: Cannot write to internal db file: C:\Program Files\reportserver\tomcat\bin\dbtmp
Jan 29, 2015 9:22:16 AM net.datenwerke.rs.core.service.internaldb.InternalDbServiceImpl getLocation
WARNING: Fallback location internaldb: C:\Program Files\reportserver\tomcat\temp
Last edited by tomharney (2015-01-29 14:29:19)
Offline
Hi Tom,
the internal db is configured in
/fileserver/etc/datasources/internaldb.cf
The default is the folder dbtmp within the reportserver directory. The WARNINGs indicate that tomcat does not have write permissions. Could you check?
In case ReportServer is not able to access the configured location it defaults to the default (tomcat) tmp directory. In your case this seems to be
C:\Program Files\reportserver\tomcat\bin\dbtmp
Could you also try to stop the server remove that dbtmp directory and restart the server.
Cheers
Arno
Offline
Hi Guys,
In my case, when only dbtmp was put into
/fileserver/etc/datasources/internaldb.cf
tomcat tried to place demo database under
...\tomcat\bin\dbtmp
(and not in
...\tomcat\webapps\dbtmp
), then could not write there, so the database landed in tmp folder and I got the same kind of WARNING info.
I've put the full path to the configuration file; now the database is where it should be.
Karolina
Last edited by karolina (2015-01-29 16:27:48)
Offline
I completely removed the dbtmp directory but that didn't solve my problem.
The strange thing about this problem. I followed the exact same procedure for the reinstall. I gave Tomcat no special permissions and it was working.
For troubleshooting purposes, I gave the all-inclusive group "Everyone" full control of the reportserver directory to see if it was a permissions problem. Also, the Local System Account has full control over the parent reportserver folder and all children.
I just installed it on my workstation and I was able to get it running. Could it be a difference between the version of Java?
Offline
Karolina:
How do I put the full path in the configuration file when I can't even get reportserver to start? The internaldb.cf file is in the virtual filesystem and I can't access that unless I login to reportserver? Right?
Offline
Hi Tom,
if all fails you could set the value directly in the database. But have you tried deleting
C:\Program Files\reportserver\tomcat\bin\dbtmp
Arno
Offline
Tom,
I'm sorry, I didn't realise you were not able even to log in.
Karolina
Offline
Hi Tom,
the tmp dir is of course
C:\Program Files\reportserver\tomcat\temp
and not
C:\Program Files\reportserver\tomcat\bin\dbtmp
Sorry.. missed that somehow. So could you check in
C:\Program Files\reportserver\tomcat\temp
for any .db files and try deleting them?
Arno
Offline
MYSTERY SOLVED!!!!!! And let this be a lesson for anyone else out there!!!
I wanted to explore the H2 database bundled with Report Server and I had downloaded and installed the H2 database in addition to Report Server. This confused Tomcat somehow. I uninstalled H2 and cleared my userprofile folder in Windows.
So this begs the question: if one wants to explore this internal report server database, what's the best way to go about doing it? Arno? Thorsten? Is there a mechanism built into Report Server?
I'll NEVER install H2 on the same instance of Report Server EVER again!
Offline
One other thing I noticed. This directory is being created: C:\Program%20Files\reportserver\tomcat\temp\rsidb
It's storing the .db files here. I suspect this is an installation problem. Long path names with spaces require double quotation marks or it can cause this phenomenon.
Offline
Hi Tom,
great . Yes, regrettably tomcat is really not happy if it finds any extra libraries anywhere. We usually try to avoid running more than one application within tomcat when possible. Especially with ReportServer this can be tricky, since it brings quite a bunch of libraries.
Anyways, there is really no need to run H2 in tomcat if you want to have a look at the database. If you go to the lib directory within reportserver (/WEB-INF/lib) you can start an H2 server which brings its own webserver
$ java -cp h2-1.4.180.jar org.h2.tools.Server
You should see something like
TCP server running at tcp://192.168.2.102:9092 (only local connections)
PG server running at pg://192.168.2.102:5435 (only local connections)
Web Console server running at http://192.168.2.102:8082 (only local connections)
Now you can access the H2 console within the browser at localhost:8082. For example to access the demo database use
the following jdbc url
jdbc:h2:file:PATH_TO/rsidb/rsdemodb
Username and password are demo and demo. Note that you need to stop ReportServer for this, since otherwise ReportServer will block access to the
files.
A second option is to use ReportServer. You can simply set up a h2 datasource within ReportServer. The one pointing to the demo data is usually created
during the installation of the demo data. Similarly you can access the internaldb (the database name is rsdb). Besides using, for example, dynamic lists
you can also directly connect to the datasource.
Assuming the datasource is demodata is located in "/datasources/Sample Datasources". Then you can open the terminal and run
cd /datasources/"Sample Datasources"
sql demodata
This provides you with a very simple SQL interface. But for many tasks it is good enough. You can now run SQL
SELECT * FROM T_AGG_CUSTOMER;
To, for example, get a list of tables run
SELECT * FROM INFORMATION_SCHEMA.TABLES WHERE TABLE_TYPE = 'TABLE'
Anyhow.. don't expect much comfort from this. But it helps at occasion.
Cheers
Arno
Offline
Hi Arno,
Does that mean it is not recommended to have 2 instances of RS on one tomcat or even one physical server?
Karolina
Offline
Hi Karolina,
I would not recommend running two instances of ReportServer within the same tomcat. I am not saying that running
multiple instances of RS in a single tomcat cannot work, but in my experience you'll sooner or later hit some very strange behavior
that is horrible to debug and which is solely related to tomcat not properly separating the running applications.
As for the same physical server, there is no restriction as far as I can see. That is, you can run multiple instances of tomcat on one physical server.
Arno
Offline
Thanks! You've saved me from troubles I definitely don't need
Karolina
Offline
Thanks, Arno! I'm loving the newest version of Report Server!
Well done to everyone at Datenwerke!
P.S. Did you notice my comment about the Program%20Files directory being created during installation? I hope my feedback and participation in the forum is useful. If I can get my head around GWT, I'll even consider contributing some code to the project in the future. Thanks for everything.
Offline
Hi Tom,
yes, I've created a bug report and we'll be looking into the "%20" problem.
I am glad to hear you like the new version of ReportServer. Be sure to spread the word (e.g., a review on sourceforge or a blog post would be fantastic).
Cheers
Arno
Offline
Related to this, on Linux the default internaldb directory seems to be pointing somewhere non-writable.
Feb 01, 2015 2:58:22 PM net.datenwerke.rs.core.service.internaldb.InternalDbServiceImpl getLocation
WARNING: Cannot write to internal db file: /usr/share/tomcat/dbtmp
Feb 01, 2015 2:58:22 PM net.datenwerke.rs.core.service.internaldb.InternalDbServiceImpl getLocation
WARNING: Fallback location internaldb: /var/cache/tomcat/temp
I think it's meant to be /usr/share/tomcat/webapps/reportserver/dbtmp. If I change the path in /fileserver/etc/datasources/internaldb.cf from "dbtmp" to "/usr/share/tomcat/webapps/reportserver/dbtmp", these warnings go away. It seems the path is being interpreted relative to $CATALINA_HOME or maybe $CATALINA_BASE instead of the webapp directory.
Thanks,
Mike
Offline
Confirmed after a fresh reinstall that the default internal db location is still /usr/share/tomcat/dbtmp.
Easy workaround though - just create and change ownership to tomcat before starting reportserver the first time.
Offline