See <https://hudson.apache.org/hudson/job/ODE-trunk-maven2-jdk5/132/>
------------------------------------------ [...truncated 18090 lines...] Sep 21, 2010 9:13:44 AM org.hibernate.cfg.HbmBinder bindCollectionSecondPass INFO: Mapping collection: org.apache.ode.daohib.bpel.hobj.HProcessInstance.correlatorSelectors -> BPEL_SELECTORS Sep 21, 2010 9:13:44 AM org.hibernate.cfg.HbmBinder bindCollectionSecondPass INFO: Mapping collection: org.apache.ode.daohib.bpel.hobj.HProcessInstance.messageExchanges -> BPEL_MESSAGE_EXCHANGE Sep 21, 2010 9:13:44 AM org.hibernate.cfg.HbmBinder bindCollectionSecondPass INFO: Mapping collection: org.apache.ode.daohib.bpel.hobj.HProcessInstance.scopes -> BPEL_SCOPE Sep 21, 2010 9:13:44 AM org.hibernate.cfg.HbmBinder bindCollectionSecondPass INFO: Mapping collection: org.apache.ode.daohib.bpel.hobj.HProcessInstance.correlationSets -> BPEL_CORRELATION_SET Sep 21, 2010 9:13:44 AM org.hibernate.cfg.HbmBinder bindCollectionSecondPass INFO: Mapping collection: org.apache.ode.daohib.bpel.hobj.HProcessInstance.activityRecoveries -> BPEL_ACTIVITY_RECOVERY Sep 21, 2010 9:13:44 AM org.hibernate.cfg.HbmBinder bindCollectionSecondPass INFO: Mapping collection: org.apache.ode.daohib.bpel.hobj.HCorrelator.messageCorrelations -> BPEL_UNMATCHED Sep 21, 2010 9:13:44 AM org.hibernate.cfg.HbmBinder bindCollectionSecondPass INFO: Mapping collection: org.apache.ode.daohib.bpel.hobj.HCorrelator.selectors -> BPEL_SELECTORS Sep 21, 2010 9:13:44 AM org.hibernate.cfg.HbmBinder bindCollectionSecondPass INFO: Mapping collection: org.apache.ode.daohib.bpel.hobj.HPartnerLink.messageExchanges -> BPEL_MESSAGE_EXCHANGE Sep 21, 2010 9:13:44 AM org.hibernate.cfg.HbmBinder bindCollectionSecondPass INFO: Mapping collection: org.apache.ode.daohib.bpel.hobj.HScope.correlationSets -> BPEL_CORRELATION_SET Sep 21, 2010 9:13:44 AM org.hibernate.cfg.HbmBinder bindCollectionSecondPass INFO: Mapping collection: org.apache.ode.daohib.bpel.hobj.HScope.variables -> BPEL_XML_DATA Sep 21, 2010 9:13:44 AM org.hibernate.cfg.HbmBinder bindCollectionSecondPass INFO: Mapping collection: org.apache.ode.daohib.bpel.hobj.HScope.partnerLinks -> BPEL_PLINK_VAL Sep 21, 2010 9:13:44 AM org.hibernate.cfg.HbmBinder bindCollectionSecondPass INFO: Mapping collection: org.apache.ode.daohib.bpel.hobj.HCorrelationSet.properties -> BPEL_CORRELATION_PROP Sep 21, 2010 9:13:44 AM org.hibernate.cfg.HbmBinder bindCollectionSecondPass INFO: Mapping collection: org.apache.ode.daohib.bpel.hobj.HXmlData.properties -> VAR_PROPERTY Sep 21, 2010 9:13:44 AM org.hibernate.connection.ConnectionProviderFactory newConnectionProvider INFO: Initializing connection provider: org.apache.ode.daohib.DataSourceConnectionProvider Sep 21, 2010 9:13:47 AM org.hibernate.cfg.SettingsFactory buildSettings INFO: RDBMS: H2, version: 1.1.117 (2009-08-09) Sep 21, 2010 9:13:47 AM org.hibernate.cfg.SettingsFactory buildSettings INFO: JDBC driver: H2 JDBC Driver, version: 1.1.117 (2009-08-09) Sep 21, 2010 9:13:48 AM org.hibernate.dialect.Dialect <init> INFO: Using dialect: org.hibernate.dialect.H2Dialect Sep 21, 2010 9:13:48 AM org.hibernate.transaction.TransactionFactoryFactory buildTransactionFactory INFO: Transaction strategy: org.hibernate.transaction.JTATransactionFactory Sep 21, 2010 9:13:48 AM org.hibernate.util.NamingHelper getInitialContext INFO: JNDI InitialContext properties:{} Sep 21, 2010 9:13:48 AM org.hibernate.transaction.TransactionManagerLookupFactory getTransactionManagerLookup INFO: instantiating TransactionManagerLookup: org.apache.ode.daohib.HibernateTransactionManagerLookup Sep 21, 2010 9:13:48 AM org.hibernate.transaction.TransactionManagerLookupFactory getTransactionManagerLookup INFO: instantiated TransactionManagerLookup Sep 21, 2010 9:13:48 AM org.hibernate.transaction.TransactionManagerLookupFactory getTransactionManagerLookup INFO: instantiating TransactionManagerLookup: org.apache.ode.daohib.HibernateTransactionManagerLookup Sep 21, 2010 9:13:48 AM org.hibernate.transaction.TransactionManagerLookupFactory getTransactionManagerLookup INFO: instantiated TransactionManagerLookup Sep 21, 2010 9:13:48 AM org.hibernate.cfg.SettingsFactory buildSettings INFO: Automatic flush during beforeCompletion(): disabled Sep 21, 2010 9:13:48 AM org.hibernate.cfg.SettingsFactory buildSettings INFO: Automatic session close at end of transaction: disabled Sep 21, 2010 9:13:48 AM org.hibernate.cfg.SettingsFactory buildSettings INFO: JDBC batch size: 15 Sep 21, 2010 9:13:48 AM org.hibernate.cfg.SettingsFactory buildSettings INFO: JDBC batch updates for versioned data: disabled Sep 21, 2010 9:13:48 AM org.hibernate.cfg.SettingsFactory buildSettings INFO: Scrollable result sets: enabled Sep 21, 2010 9:13:48 AM org.hibernate.cfg.SettingsFactory buildSettings INFO: JDBC3 getGeneratedKeys(): enabled Sep 21, 2010 9:13:48 AM org.hibernate.cfg.SettingsFactory buildSettings INFO: Connection release mode: auto Sep 21, 2010 9:13:48 AM org.hibernate.cfg.SettingsFactory buildSettings INFO: Default batch fetch size: 1 Sep 21, 2010 9:13:48 AM org.hibernate.cfg.SettingsFactory buildSettings INFO: Generate SQL with comments: disabled Sep 21, 2010 9:13:48 AM org.hibernate.cfg.SettingsFactory buildSettings INFO: Order SQL updates by primary key: disabled Sep 21, 2010 9:13:48 AM org.hibernate.cfg.SettingsFactory buildSettings INFO: Order SQL inserts for batching: disabled Sep 21, 2010 9:13:48 AM org.hibernate.cfg.SettingsFactory createQueryTranslatorFactory INFO: Query translator: org.hibernate.hql.ast.ASTQueryTranslatorFactory Sep 21, 2010 9:13:48 AM org.hibernate.hql.ast.ASTQueryTranslatorFactory <init> INFO: Using ASTQueryTranslatorFactory Sep 21, 2010 9:13:48 AM org.hibernate.cfg.SettingsFactory buildSettings INFO: Query language substitutions: {} Sep 21, 2010 9:13:48 AM org.hibernate.cfg.SettingsFactory buildSettings INFO: JPA-QL strict compliance: disabled Sep 21, 2010 9:13:48 AM org.hibernate.cfg.SettingsFactory buildSettings INFO: Second-level cache: enabled Sep 21, 2010 9:13:48 AM org.hibernate.cfg.SettingsFactory buildSettings INFO: Query cache: disabled Sep 21, 2010 9:13:48 AM org.hibernate.cfg.SettingsFactory createRegionFactory INFO: Cache region factory : org.hibernate.cache.impl.NoCachingRegionFactory Sep 21, 2010 9:13:48 AM org.hibernate.cfg.SettingsFactory buildSettings INFO: Optimize cache for minimal puts: disabled Sep 21, 2010 9:13:48 AM org.hibernate.cfg.SettingsFactory buildSettings INFO: Structured second-level cache entries: disabled Sep 21, 2010 9:13:48 AM org.hibernate.cfg.SettingsFactory buildSettings INFO: Statistics: disabled Sep 21, 2010 9:13:48 AM org.hibernate.cfg.SettingsFactory buildSettings INFO: Deleted entity synthetic identifier rollback: disabled Sep 21, 2010 9:13:48 AM org.hibernate.cfg.SettingsFactory buildSettings INFO: Default entity-mode: pojo Sep 21, 2010 9:13:48 AM org.hibernate.cfg.SettingsFactory buildSettings INFO: Named query checking : enabled Sep 21, 2010 9:13:48 AM org.hibernate.impl.SessionFactoryImpl <init> INFO: building session factory Sep 21, 2010 9:13:48 AM org.apache.ode.axis2.ODEServer initDAO SEVERE: Error instantiating DAO Connection Factory class org.apache.ode.axis2.instancecleanup.HibDaoConnectionFactoryImpl. org.hibernate.HibernateException: Unable to instantiate default tuplizer [org.hibernate.tuple.entity.PojoEntityTuplizer] at org.hibernate.tuple.entity.EntityTuplizerFactory.constructTuplizer(EntityTuplizerFactory.java:110) at org.hibernate.tuple.entity.EntityTuplizerFactory.constructDefaultTuplizer(EntityTuplizerFactory.java:135) at org.hibernate.tuple.entity.EntityEntityModeToTuplizerMapping.<init>(EntityEntityModeToTuplizerMapping.java:80) at org.hibernate.tuple.entity.EntityMetamodel.<init>(EntityMetamodel.java:323) at org.hibernate.persister.entity.AbstractEntityPersister.<init>(AbstractEntityPersister.java:456) at org.hibernate.persister.entity.SingleTableEntityPersister.<init>(SingleTableEntityPersister.java:131) at org.hibernate.persister.PersisterFactory.createClassPersister(PersisterFactory.java:84) at org.hibernate.impl.SessionFactoryImpl.<init>(SessionFactoryImpl.java:267) at org.hibernate.cfg.Configuration.buildSessionFactory(Configuration.java:1341) at org.apache.ode.daohib.SessionManager.<init>(SessionManager.java:73) at org.apache.ode.axis2.instancecleanup.HibDaoConnectionFactoryImpl$1.<init>(HibDaoConnectionFactoryImpl.java:57) at org.apache.ode.axis2.instancecleanup.HibDaoConnectionFactoryImpl.createSessionManager(HibDaoConnectionFactoryImpl.java:55) at org.apache.ode.daohib.bpel.BpelDAOConnectionFactoryImpl.init(BpelDAOConnectionFactoryImpl.java:119) at org.apache.ode.il.dbutil.Database.createDaoCF(Database.java:122) at org.apache.ode.axis2.ODEServer.initDAO(ODEServer.java:453) at org.apache.ode.axis2.ODEServer.init(ODEServer.java:188) at org.apache.ode.axis2.ODEAxis2Server.start(ODEAxis2Server.java:92) at org.apache.ode.axis2.Axis2TestBase.startServer(Axis2TestBase.java:177) at org.apache.ode.axis2.Axis2TestBase.startServer(Axis2TestBase.java:158) at org.apache.ode.axis2.Axis2TestBase.setUp(Axis2TestBase.java:223) at sun.reflect.NativeMethodAccessorImpl.invoke0(Native Method) at sun.reflect.NativeMethodAccessorImpl.invoke(NativeMethodAccessorImpl.java:39) at sun.reflect.DelegatingMethodAccessorImpl.invoke(DelegatingMethodAccessorImpl.java:25) at java.lang.reflect.Method.invoke(Method.java:585) at org.testng.internal.MethodHelper.invokeMethod(MethodHelper.java:580) at org.testng.internal.Invoker.invokeConfigurationMethod(Invoker.java:398) at org.testng.internal.Invoker.invokeConfigurations(Invoker.java:145) at org.testng.internal.Invoker.invokeMethod(Invoker.java:427) at org.testng.internal.Invoker.invokeTestMethod(Invoker.java:617) at org.testng.internal.Invoker.invokeTestMethods(Invoker.java:885) at org.testng.internal.TestMethodWorker.invokeTestMethods(TestMethodWorker.java:126) at org.testng.internal.TestMethodWorker.run(TestMethodWorker.java:110) at org.testng.TestRunner.runWorkers(TestRunner.java:712) at org.testng.TestRunner.privateRun(TestRunner.java:582) at org.testng.TestRunner.run(TestRunner.java:477) at org.testng.SuiteRunner.runTest(SuiteRunner.java:324) at org.testng.SuiteRunner.runSequentially(SuiteRunner.java:319) at org.testng.SuiteRunner.privateRun(SuiteRunner.java:292) at org.testng.SuiteRunner.run(SuiteRunner.java:198) at org.testng.TestNG.createAndRunSuiteRunners(TestNG.java:821) at org.testng.TestNG.runSuitesLocally(TestNG.java:788) at org.testng.TestNG.run(TestNG.java:708) at org.apache.maven.surefire.testng.TestNGExecutor.run(TestNGExecutor.java:62) at org.apache.maven.surefire.testng.TestNGDirectoryTestSuite.execute(TestNGDirectoryTestSuite.java:102) at org.apache.maven.surefire.Surefire.run(Surefire.java:109) at sun.reflect.NativeMethodAccessorImpl.invoke0(Native Method) at sun.reflect.NativeMethodAccessorImpl.invoke(NativeMethodAccessorImpl.java:39) at sun.reflect.DelegatingMethodAccessorImpl.invoke(DelegatingMethodAccessorImpl.java:25) at java.lang.reflect.Method.invoke(Method.java:585) at org.apache.maven.surefire.booter.SurefireBooter.runSuitesInProcess(SurefireBooter.java:290) at org.apache.maven.surefire.booter.SurefireBooter.main(SurefireBooter.java:1017) Caused by: java.lang.reflect.InvocationTargetException at sun.reflect.NativeConstructorAccessorImpl.newInstance0(Native Method) at sun.reflect.NativeConstructorAccessorImpl.newInstance(NativeConstructorAccessorImpl.java:39) at sun.reflect.DelegatingConstructorAccessorImpl.newInstance(DelegatingConstructorAccessorImpl.java:27) at java.lang.reflect.Constructor.newInstance(Constructor.java:494) at org.hibernate.tuple.entity.EntityTuplizerFactory.constructTuplizer(EntityTuplizerFactory.java:107) ... 50 more Caused by: java.lang.NoClassDefFoundError: javassist/util/proxy/MethodFilter at org.hibernate.bytecode.javassist.BytecodeProviderImpl.getProxyFactoryFactory(BytecodeProviderImpl.java:49) at org.hibernate.tuple.entity.PojoEntityTuplizer.buildProxyFactoryInternal(PojoEntityTuplizer.java:208) at org.hibernate.tuple.entity.PojoEntityTuplizer.buildProxyFactory(PojoEntityTuplizer.java:186) at org.hibernate.tuple.entity.AbstractEntityTuplizer.<init>(AbstractEntityTuplizer.java:151) at org.hibernate.tuple.entity.PojoEntityTuplizer.<init>(PojoEntityTuplizer.java:78) ... 55 more Tests run: 3, Failures: 1, Errors: 0, Skipped: 2, Time elapsed: 486.204 sec <<< FAILURE! [SimpleHTTPServer] Stop called Running TestSuite Sep 21, 2010 9:14:03 AM org.apache.ode.axis2.Axis2TestBase <clinit> INFO: test.ports=8888,7070 Test config: <https://hudson.apache.org/hudson/job/ODE-trunk-maven2-jdk5/ws/trunk/axis2-war/target/webapp/WEB-INF/conf.hib-derby.> Sep 21, 2010 9:14:04 AM org.apache.ode.axis2.ODEAxis2Server <init> INFO: Ode Root Dir: <https://hudson.apache.org/hudson/job/ODE-trunk-maven2-jdk5/ws/trunk/axis2-war/target/webapp/WEB-INF> Sep 21, 2010 9:14:04 AM org.apache.ode.axis2.ODEAxis2Server <init> INFO: Axis2 Conf file: <https://hudson.apache.org/hudson/job/ODE-trunk-maven2-jdk5/ws/trunk/axis2-war/target/webapp/WEB-INF/conf/axis2.xml> Sep 21, 2010 9:14:04 AM org.apache.ode.axis2.ODEAxis2Server <init> INFO: Axis2 Repo dir: <https://hudson.apache.org/hudson/job/ODE-trunk-maven2-jdk5/ws/trunk/axis2-war/target/webapp/WEB-INF> Build timed out. Aborting Sending e-mails to: dev@ode.apache.org killed. [HUDSON] Recording test resultsSending e-mails to: dev@ode.apache.org Sending e-mails to: dev@ode.apache.org Sending e-mails to: dev@ode.apache.org channel stopped [INFO] ------------------------------------------------------------------------ [ERROR] FATAL ERROR [INFO] ------------------------------------------------------------------------ [INFO] null [INFO] ------------------------------------------------------------------------ [INFO] Trace java.lang.reflect.UndeclaredThrowableException at $Proxy2.isArchivingDisabled(Unknown Source) at hudson.maven.MavenBuildProxy$Filter.isArchivingDisabled(MavenBuildProxy.java:222) at hudson.maven.reporters.MavenArtifact.archive(MavenArtifact.java:192) at hudson.maven.reporters.MavenArtifactArchiver.postBuild(MavenArtifactArchiver.java:107) at hudson.maven.MavenModuleSetBuild$Builder.postModule(MavenModuleSetBuild.java:731) at hudson.maven.MavenBuilder$Adapter.fireLeaveModule(MavenBuilder.java:317) at hudson.maven.MavenBuilder$Adapter.postBuild(MavenBuilder.java:275) at org.apache.maven.lifecycle.LifecycleExecutorInterceptor.execute(LifecycleExecutorInterceptor.java:68) at org.apache.maven.DefaultMaven.doExecute(DefaultMaven.java:328) at org.apache.maven.DefaultMaven.execute(DefaultMaven.java:138) at org.apache.maven.cli.MavenCli.main(MavenCli.java:362) at sun.reflect.NativeMethodAccessorImpl.invoke0(Native Method) at sun.reflect.NativeMethodAccessorImpl.invoke(NativeMethodAccessorImpl.java:39) at sun.reflect.DelegatingMethodAccessorImpl.invoke(DelegatingMethodAccessorImpl.java:25) at java.lang.reflect.Method.invoke(Method.java:585) at org.codehaus.classworlds.Launcher.launchEnhanced(Launcher.java:315) at org.codehaus.classworlds.Launcher.launch(Launcher.java:255) at hudson.maven.agent.Main.launch(Main.java:165) at hudson.maven.MavenBuilder.call(MavenBuilder.java:165) at hudson.maven.MavenModuleSetBuild$Builder.call(MavenModuleSetBuild.java:681) at hudson.maven.MavenModuleSetBuild$Builder.call(MavenModuleSetBuild.java:625) at hudson.remoting.UserRequest.perform(UserRequest.java:114) at hudson.remoting.UserRequest.perform(UserRequest.java:48) at hudson.remoting.Request$2.run(Request.java:270) at java.util.concurrent.Executors$RunnableAdapter.call(Executors.java:417) at java.util.concurrent.FutureTask$Sync.innerRun(FutureTask.java:269) at java.util.concurrent.FutureTask.run(FutureTask.java:123) at java.util.concurrent.ThreadPoolExecutor$Worker.runTask(ThreadPoolExecutor.java:650) at java.util.concurrent.ThreadPoolExecutor$Worker.run(ThreadPoolExecutor.java:675) at java.lang.Thread.run(Thread.java:595) Caused by: hudson.remoting.ChannelClosedException: channel is already closed at hudson.remoting.Channel.send(Channel.java:414) at hudson.remoting.Request.call(Request.java:105) at hudson.remoting.Channel.call(Channel.java:557) at hudson.remoting.RemoteInvocationHandler.invoke(RemoteInvocationHandler.java:158) ... 30 more Caused by: hudson.remoting.Channel$OrderlyShutdown at hudson.remoting.Channel$CloseCommand.execute(Channel.java:691) at hudson.remoting.Channel$ReaderThread.run(Channel.java:890) Caused by: Command close created at at hudson.remoting.Command.<init>(Command.java:58) at hudson.remoting.Command.<init>(Command.java:47) at hudson.remoting.Channel$CloseCommand.<init>(Channel.java:687) at hudson.remoting.Channel$CloseCommand.<init>(Channel.java:687) at hudson.remoting.Channel.close(Channel.java:732) at hudson.slaves.Channels$1.close(Channels.java:91) at hudson.maven.ProcessCache$MavenProcess.discard(ProcessCache.java:145) at hudson.maven.MavenModuleSetBuild$RunnerImpl.doRun(MavenModuleSetBuild.java:472) at hudson.model.AbstractBuild$AbstractRunner.run(AbstractBuild.java:416) at hudson.model.Run.run(Run.java:1273) at hudson.maven.MavenModuleSetBuild.run(MavenModuleSetBuild.java:291) at hudson.model.ResourceController.execute(ResourceController.java:88) at hudson.model.Executor.run(Executor.java:129) [INFO] ------------------------------------------------------------------------ [INFO] Total time: 238 minutes 17 seconds [INFO] Finished at: Tue Sep 21 09:22:14 EDT 2010 [INFO] Final Memory: 111M/465M [INFO] ------------------------------------------------------------------------