[wf 9.0.2] WFLYCTL0159: Operation handler failed to complete
hr.stoyanov Dec 4, 2015 6:45 AMGetting very unhelpful deployment error message: WFLYCTL0159: Operation handler failed to complete. Any idea? How can I get a better diagnostics?
The WAR app uses a XA datasource, which when verified from the admin console works. I am also using Apache proxy/mod_cluster :
========================================================================================================
...
<xa-datasource jndi-name="java:jboss/datasources/S4GDS" pool-name="S4GDS" use-java-context="true">
<xa-datasource-property name="ServerName">localhost</xa-datasource-property>
<xa-datasource-property name="PortNumber">5432</xa-datasource-property>
<xa-datasource-property name="DatabaseName">default</xa-datasource-property>
<driver>postgres</driver>
<xa-pool>
<min-pool-size>0</min-pool-size>
<initial-pool-size>1</initial-pool-size>
<max-pool-size>100</max-pool-size>
<prefill>true</prefill>
</xa-pool>
<security>
<user-name>s4g</user-name>
<password>admin</password>
</security>
<timeout>
<blocking-timeout-millis>5000</blocking-timeout-millis>
</timeout>
</xa-datasource>
...
<driver name="postgres" module="org.postgres">
<xa-datasource-class>org.postgresql.xa.PGXADataSource</xa-datasource-class>
<datasource-class>org.postgresql.ds.PGSimpleDataSource</datasource-class>
</driver>
</drivers>
...
<!-- Config: mod cluser -->
<subsystem xmlns="urn:jboss:domain:modcluster:2.0">
<mod-cluster-config connector="ajp" proxies="the-proxy">
<dynamic-load-provider>
<load-metric type="busyness"/>
</dynamic-load-provider>
</mod-cluster-config>
</subsystem>
...
<socket-binding-group name="standard-sockets" default-interface="public" port-offset="${jboss.socket.binding.port-offset:0}">
...
<!-- Config: mod cluser -->
<outbound-socket-binding name="the-proxy">
<remote-destination host="localhost" port="6666"/>
</outbound-socket-binding>
</socket-binding-group>
===============================================================
2015-12-04 10:59:17,954 INFO [org.jboss.as.server.deployment] (MSC service thread 1-7) WFLYSRV0027: Starting deployment of "s4g-web.war" (runtime-name: "s4g-web.war")
2015-12-04 10:59:20,118 INFO [org.jboss.as.jpa] (MSC service thread 1-6) WFLYJPA0002: Read persistence.xml for s4g
2015-12-04 10:59:20,370 WARN [org.jboss.as.dependency.private] (MSC service thread 1-1) WFLYSRV0018: Deployment "deployment.s4g-web.war" is using a private module ("org.infinispan:main") which may be changed or removed in future versions without notice.
2015-12-04 10:59:20,370 WARN [org.jboss.as.dependency.private] (MSC service thread 1-1) WFLYSRV0018: Deployment "deployment.s4g-web.war" is using a private module ("org.infinispan:main") which may be changed or removed in future versions without notice.
2015-12-04 10:59:20,371 WARN [org.jboss.as.dependency.private] (MSC service thread 1-1) WFLYSRV0018: Deployment "deployment.s4g-web.war" is using a private module ("org.infinispan.commons:main") which may be changed or removed in future versions without notice.
2015-12-04 10:59:20,371 WARN [org.jboss.as.dependency.private] (MSC service thread 1-1) WFLYSRV0018: Deployment "deployment.s4g-web.war" is using a private module ("org.infinispan.commons:main") which may be changed or removed in future versions without notice.
2015-12-04 10:59:20,394 INFO [org.jboss.as.jpa] (ServerService Thread Pool -- 92) WFLYJPA0010: Starting Persistence Unit (phase 1 of 2) Service 's4g-web.war#s4g'
2015-12-04 10:59:20,394 INFO [org.hibernate.jpa.internal.util.LogHelper] (ServerService Thread Pool -- 92) HHH000204: Processing PersistenceUnitInfo [
name: s4g
...]
2015-12-04 10:59:20,396 INFO [org.jboss.weld.deployer] (MSC service thread 1-5) WFLYWELD0003: Processing weld deployment s4g-web.war
2015-12-04 10:59:20,416 INFO [org.jboss.as.ejb3.deployment.processors.EjbJndiBindingsDeploymentUnitProcessor] (MSC service thread 1-5) JNDI bindings for session bean named ScreensManagerImpl in deployment unit deployment "s4g-web.war" are as follows:
java:global/s4g-web/ScreensManagerImpl!com.peruncs.s4g.web.gwt.client.shared.ScreensManager
java:app/s4g-web/ScreensManagerImpl!com.peruncs.s4g.web.gwt.client.shared.ScreensManager
java:module/ScreensManagerImpl!com.peruncs.s4g.web.gwt.client.shared.ScreensManager
java:global/s4g-web/ScreensManagerImpl
java:app/s4g-web/ScreensManagerImpl
java:module/ScreensManagerImpl
2015-12-04 10:59:20,518 INFO [org.jboss.weld.deployer] (MSC service thread 1-2) WFLYWELD0006: Starting Services for CDI deployment: s4g-web.war
2015-12-04 10:59:20,526 INFO [org.jboss.weld.deployer] (MSC service thread 1-4) WFLYWELD0009: Starting weld service for deployment s4g-web.war
2015-12-04 10:59:20,553 INFO [org.jboss.as.clustering.infinispan] (ServerService Thread Pool -- 93) WFLYCLINF0002: Started S4GLocalCache cache from S4GCacheContainer container
2015-12-04 10:59:20,575 INFO [org.jboss.as.jpa] (ServerService Thread Pool -- 92) WFLYJPA0010: Starting Persistence Unit (phase 2 of 2) Service 's4g-web.war#s4g'
2015-12-04 10:59:20,598 INFO [org.hibernate.dialect.Dialect] (ServerService Thread Pool -- 92) HHH000400: Using dialect: org.hibernate.dialect.PostgreSQL9Dialect
2015-12-04 10:59:20,600 INFO [org.hibernate.engine.jdbc.internal.LobCreatorBuilder] (ServerService Thread Pool -- 92) HHH000424: Disabling contextual LOB creation as createClob() method threw error : java.lang.reflect.InvocationTargetException
2015-12-04 10:59:20,643 INFO [org.hibernate.hql.internal.ast.ASTQueryTranslatorFactory] (ServerService Thread Pool -- 92) HHH000397: Using ASTQueryTranslatorFactory
2015-12-04 10:59:20,704 INFO [org.jboss.as.clustering.infinispan] (ServerService Thread Pool -- 92) WFLYCLINF0002: Started s4g-web.war#s4g.com.peruncs.s4g.web.gwt.server.SymbolkListItem cache from hibernate container
2015-12-04 10:59:20,708 INFO [org.jboss.as.clustering.infinispan] (ServerService Thread Pool -- 92) WFLYCLINF0002: Started pending-puts cache from hibernate container
2015-12-04 10:59:20,753 INFO [org.jboss.as.clustering.infinispan] (ServerService Thread Pool -- 92) WFLYCLINF0002: Started s4g-web.war#s4g.com.peruncs.s4g.web.gwt.server.Screen cache from hibernate container
2015-12-04 10:59:20,762 INFO [org.jboss.as.clustering.infinispan] (ServerService Thread Pool -- 92) WFLYCLINF0002: Started s4g-web.war#s4g.com.peruncs.s4g.web.gwt.server.BellWeather cache from hibernate container
2015-12-04 10:59:20,770 INFO [org.jboss.as.clustering.infinispan] (ServerService Thread Pool -- 92) WFLYCLINF0002: Started s4g-web.war#s4g.com.peruncs.s4g.web.gwt.server.SymbolList cache from hibernate container
2015-12-04 10:59:20,779 INFO [org.jboss.as.clustering.infinispan] (ServerService Thread Pool -- 92) WFLYCLINF0002: Started s4g-web.war#s4g.com.peruncs.s4g.web.gwt.server.Preferences cache from hibernate container
2015-12-04 10:59:20,787 INFO [org.jboss.as.clustering.infinispan] (ServerService Thread Pool -- 92) WFLYCLINF0002: Started s4g-web.war#s4g.com.peruncs.s4g.web.gwt.server.FinancialDetailBase cache from hibernate container
2015-12-04 10:59:20,799 INFO [org.jboss.as.clustering.infinispan] (ServerService Thread Pool -- 92) WFLYCLINF0002: Started s4g-web.war#s4g.com.peruncs.s4g.web.gwt.server.StockListSymbol cache from hibernate container
2015-12-04 10:59:20,817 INFO [org.jboss.as.clustering.infinispan] (ServerService Thread Pool -- 92) WFLYCLINF0002: Started s4g-web.war#s4g.com.peruncs.s4g.web.gwt.server.Indicator cache from hibernate container
2015-12-04 10:59:20,937 INFO [org.jboss.weld.Event] (MSC service thread 1-4) WELD-000411: Observer method [BackedAnnotatedMethod] public org.jboss.errai.security.keycloak.extension.AuthenticationServiceWrapperExtension.processAuthenticationServiceTypes(@Observes ProcessAnnotatedType<Object>) receives events for all
annotated types. Consider restricting events using @WithAnnotations or a generic type with bounds.
2015-12-04 10:59:20,950 INFO [org.jboss.weld.Event] (MSC service thread 1-4) WELD-000411: Observer method [BackedAnnotatedMethod] public org.jboss.errai.security.server.SecurityAnnotationExtension.addParameterLogger(@Observes ProcessAnnotatedType<Object>) receives events for all annotated types. Consider restricting
events using @WithAnnotations or a generic type with bounds.
2015-12-04 10:59:20,953 INFO [org.jboss.weld.Event] (MSC service thread 1-4) WELD-000411: Observer method [BackedAnnotatedMethod] public org.jboss.errai.cdi.server.CDIExtensionPoints.observeResources(@Observes ProcessAnnotatedType<Object>) receives events for all annotated types. Consider restricting events using @W
ithAnnotations or a generic type with bounds.
2015-12-04 10:59:20,959 INFO [org.jboss.errai.cdi.server.CDIExtensionPoints] (MSC service thread 1-4) starting errai cdi ...
2015-12-04 10:59:21,199 INFO [org.jboss.errai.cdi.server.CDIExtensionPoints] (MSC service thread 1-4) discovered errai service: [BackedAnnotatedType] public @Dependent @Service class org.jboss.errai.security.server.NonCachingUserServiceImpl
2015-12-04 10:59:21,257 INFO [org.jboss.errai.cdi.server.CDIExtensionPoints] (MSC service thread 1-4) discovered errai service: [BackedAnnotatedType] public @Service @SessionScoped class org.jboss.errai.security.keycloak.KeycloakAuthenticationService
2015-12-04 10:59:21,271 WARN [org.jboss.weld.Bootstrap] (weld-worker-1) WELD-001125: Illegal bean type java.util.Comparator<javax.enterprise.inject.spi.AnnotatedField<? super T>> ignored on [EnhancedAnnotatedTypeImpl] private static class org.apache.deltaspike.core.util.Annotateds$AnnotatedFieldComparator
2015-12-04 10:59:21,272 WARN [org.jboss.weld.Bootstrap] (weld-worker-3) WELD-001125: Illegal bean type java.util.Comparator<javax.enterprise.inject.spi.AnnotatedMethod<? super T>> ignored on [EnhancedAnnotatedTypeImpl] private static class org.apache.deltaspike.core.util.Annotateds$AnnotatedMethodComparator
2015-12-04 10:59:21,277 WARN [org.jboss.weld.Bootstrap] (weld-worker-3) WELD-001125: Illegal bean type java.util.Comparator<javax.enterprise.inject.spi.AnnotatedConstructor<? super T>> ignored on [EnhancedAnnotatedTypeImpl] private static class org.apache.deltaspike.core.util.Annotateds$AnnotatedConstructorComparat
or
2015-12-04 10:59:21,280 WARN [org.jboss.weld.Bootstrap] (weld-worker-3) WELD-001125: Illegal bean type java.util.Comparator<javax.enterprise.inject.spi.AnnotatedCallable<? super T>> ignored on [EnhancedAnnotatedTypeImpl] private static class org.apache.deltaspike.core.util.Annotateds$AnnotatedCallableComparator
2015-12-04 10:59:21,537 INFO [org.jboss.errai.common.metadata.MetaDataScanner] (Thread-128) added class scanning extensions: org.jboss.errai.common.metadata.JbossVFsTypeHandler
2015-12-04 10:59:21,866 INFO [org.jboss.errai.reflections.Reflections] (Thread-128) Reflections took 326 ms to scan 15 urls, producing 546 keys and 2907 values [using 2 cores]
2015-12-04 10:59:22,005 ERROR [org.jboss.as.server] (management-handler-thread - 6) WFLYSRV0021: Deploy of deployment "s4g-web.war" was rolled back with the following failure message: "WFLYCTL0159: Operation handler failed to complete"
2015-12-04 10:59:22,018 INFO [org.jboss.as.jpa] (ServerService Thread Pool -- 98) WFLYJPA0011: Stopping Persistence Unit (phase 2 of 2) Service 's4g-web.war#s4g'
2015-12-04 10:59:22,021 INFO [org.jboss.as.clustering.infinispan] (ServerService Thread Pool -- 98) WFLYCLINF0003: Stopped s4g-web.war#s4g.com.peruncs.s4g.web.gwt.server.SymbolkListItem cache from hibernate container
2015-12-04 10:59:22,023 INFO [org.jboss.as.clustering.infinispan] (ServerService Thread Pool -- 98) WFLYCLINF0003: Stopped s4g-web.war#s4g.com.peruncs.s4g.web.gwt.server.Screen cache from hibernate container
2015-12-04 10:59:22,025 INFO [org.jboss.as.clustering.infinispan] (ServerService Thread Pool -- 98) WFLYCLINF0003: Stopped s4g-web.war#s4g.com.peruncs.s4g.web.gwt.server.BellWeather cache from hibernate container
2015-12-04 10:59:22,028 INFO [org.jboss.as.clustering.infinispan] (ServerService Thread Pool -- 98) WFLYCLINF0003: Stopped s4g-web.war#s4g.com.peruncs.s4g.web.gwt.server.SymbolList cache from hibernate container
2015-12-04 10:59:22,033 INFO [org.jboss.as.clustering.infinispan] (ServerService Thread Pool -- 98) WFLYCLINF0003: Stopped s4g-web.war#s4g.com.peruncs.s4g.web.gwt.server.Preferences cache from hibernate container
2015-12-04 10:59:22,035 INFO [org.jboss.as.clustering.infinispan] (ServerService Thread Pool -- 98) WFLYCLINF0003: Stopped s4g-web.war#s4g.com.peruncs.s4g.web.gwt.server.FinancialDetailBase cache from hibernate container
2015-12-04 10:59:22,036 INFO [org.jboss.as.clustering.infinispan] (ServerService Thread Pool -- 98) WFLYCLINF0003: Stopped s4g-web.war#s4g.com.peruncs.s4g.web.gwt.server.StockListSymbol cache from hibernate container
2015-12-04 10:59:22,038 INFO [org.jboss.as.clustering.infinispan] (ServerService Thread Pool -- 98) WFLYCLINF0003: Stopped s4g-web.war#s4g.com.peruncs.s4g.web.gwt.server.Indicator cache from hibernate container
2015-12-04 10:59:22,042 INFO [org.jboss.as.clustering.infinispan] (ServerService Thread Pool -- 98) WFLYCLINF0002: Started local-query cache from hibernate container
2015-12-04 10:59:22,049 INFO [org.jboss.weld.deployer] (MSC service thread 1-1) WFLYWELD0010: Stopping weld service for deployment s4g-web.war
2015-12-04 10:59:22,049 INFO [org.jboss.as.jpa] (ServerService Thread Pool -- 98) WFLYJPA0011: Stopping Persistence Unit (phase 1 of 2) Service 's4g-web.war#s4g'
2015-12-04 10:59:22,058 INFO [org.infinispan.eviction.impl.PassivationManagerImpl] (ServerService Thread Pool -- 98) ISPN000029: Passivating all entries to disk
2015-12-04 10:59:22,058 INFO [org.infinispan.eviction.impl.PassivationManagerImpl] (ServerService Thread Pool -- 98) ISPN000030: Passivated 0 entries in 0 milliseconds
2015-12-04 10:59:22,062 INFO [org.jboss.as.clustering.infinispan] (MSC service thread 1-4) WFLYCLINF0003: Stopped local-query cache from hibernate container
2015-12-04 10:59:22,064 INFO [org.jboss.as.clustering.infinispan] (MSC service thread 1-4) WFLYCLINF0003: Stopped pending-puts cache from hibernate container
2015-12-04 10:59:22,065 INFO [org.jboss.as.clustering.infinispan] (ServerService Thread Pool -- 98) WFLYCLINF0003: Stopped S4GLocalCache cache from S4GCacheContainer container
2015-12-04 10:59:22,123 INFO [org.jboss.as.server.deployment] (MSC service thread 1-6) WFLYSRV0028: Stopped deployment s4g-web.war (runtime-name: s4g-web.war) in 117ms
2015-12-04 10:59:22,124 INFO [org.jboss.as.controller] (management-handler-thread - 6) WFLYCTL0183: Service status report