[JBoss JIRA] (WFLY-5444) Lost data on session
by Petr Sígl (JIRA)
[ https://issues.jboss.org/browse/WFLY-5444?page=com.atlassian.jira.plugin.... ]
Petr Sígl reopened WFLY-5444:
-----------------------------
I am sorry, but I have tried this configuration:
{noformat}
<cache-container name="web" default-cache="repl" module="org.wildfly.clustering.web.infinispan">
<transport lock-timeout="60000"/>
<replicated-cache name="repl" mode="ASYNC">
<locking isolation="REPEATABLE_READ"/>
<transaction locking="PESSIMISTIC"/>
<file-store/>
</replicated-cache>
</cache-container>
{noformat}
and result is the same:
{noformat}
2015-10-02 18:57:32,459 DEBUG [cz.cmhb.portal.app.informatorium.web.login.actions.DoLoginAction] (default task-11) Login action -> create new session: gnKJYYsOL6U-7z0vCaWAU4rCNc8d0ShPl36_9SoD
2015-10-02 18:57:32,461 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionAttributteListener] (default task-11) Attribute added : SecurityContext : cz.cmhb.portal.service.security.to.AuthenticationDetail@ac0693c session: gnKJYYsOL6U-7z0vCaWAU4rCNc8d0ShPl36_9SoD source: io.undertow.servlet.spec.HttpSessionImpl@48d965a5
2015-10-02 18:57:32,461 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionAttributteListener] (default task-11) Attribute added : MujTestovaciAttribut : JakozeMusiBytNaTeSessionPorad!!! session: gnKJYYsOL6U-7z0vCaWAU4rCNc8d0ShPl36_9SoD source: io.undertow.servlet.spec.HttpSessionImpl@48d965a5
2015-10-02 18:57:32,462 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionAttributteListener] (default task-11) Attribute added : DebugSessionBindingListener : cz.cmhb.portal.app.informatorium.listener.DebugSessionBindingListener@de9f0a4 session: gnKJYYsOL6U-7z0vCaWAU4rCNc8d0ShPl36_9SoD source: io.undertow.servlet.spec.HttpSessionImpl@48d965a5
2015-10-02 18:57:32,462 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionBindingListener] (default task-11) Value bound : DebugSessionBindingListener : cz.cmhb.portal.app.informatorium.listener.DebugSessionBindingListener@de9f0a4 session: gnKJYYsOL6U-7z0vCaWAU4rCNc8d0ShPl36_9SoD source: io.undertow.servlet.spec.HttpSessionImpl@48d965a5
2015-10-02 18:57:32,463 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionAttributteListener] (default task-11) Attribute added : DebugSessionActivationListener : cz.cmhb.portal.app.informatorium.listener.DebugSessionActivationListener@6e7a27aa session: gnKJYYsOL6U-7z0vCaWAU4rCNc8d0ShPl36_9SoD source: io.undertow.servlet.spec.HttpSessionImpl@48d965a5
2015-10-02 18:57:32,463 DEBUG [cz.cmhb.portal.app.informatorium.web.login.actions.DoLoginAction] (default task-11) PUT: Session id = gnKJYYsOL6U-7z0vCaWAU4rCNc8d0ShPl36_9SoD
2015-10-02 18:57:32,463 DEBUG [cz.cmhb.portal.app.informatorium.web.login.actions.DoLoginAction] (default task-11) Attr: DebugSessionBindingListener cz.cmhb.portal.app.informatorium.listener.DebugSessionBindingListener@de9f0a4
2015-10-02 18:57:32,463 DEBUG [cz.cmhb.portal.app.informatorium.web.login.actions.DoLoginAction] (default task-11) Attr: DebugSessionActivationListener cz.cmhb.portal.app.informatorium.listener.DebugSessionActivationListener@6e7a27aa
2015-10-02 18:57:32,463 DEBUG [cz.cmhb.portal.app.informatorium.web.login.actions.DoLoginAction] (default task-11) Attr: SecurityContext cz.cmhb.portal.service.security.to.AuthenticationDetail@ac0693c
2015-10-02 18:57:32,464 DEBUG [cz.cmhb.portal.app.informatorium.web.login.actions.DoLoginAction] (default task-11) Attr: MujTestovaciAttribut JakozeMusiBytNaTeSessionPorad!!!
2015-10-02 18:57:32,467 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionActivationListener] (default task-11) Passivate session: gnKJYYsOL6U-7z0vCaWAU4rCNc8d0ShPl36_9SoD source: org.wildfly.clustering.web.session.ImmutableHttpSessionAdapter@677a2ad0
2015-10-02 18:57:32,467 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionActivationListener] (default task-11) Attr: DebugSessionBindingListener cz.cmhb.portal.app.informatorium.listener.DebugSessionBindingListener@de9f0a4
2015-10-02 18:57:32,467 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionActivationListener] (default task-11) Attr: DebugSessionActivationListener cz.cmhb.portal.app.informatorium.listener.DebugSessionActivationListener@6e7a27aa
2015-10-02 18:57:32,468 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionActivationListener] (default task-11) Attr: SecurityContext cz.cmhb.portal.service.security.to.AuthenticationDetail@ac0693c
2015-10-02 18:57:32,468 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionActivationListener] (default task-11) Attr: MujTestovaciAttribut JakozeMusiBytNaTeSessionPorad!!!
2015-10-02 18:57:32,468 TRACE [org.wildfly.clustering.web.infinispan] (default task-11) Session gnKJYYsOL6U-7z0vCaWAU4rCNc8d0ShPl36_9SoD will expire in 120000 ms
2015-10-02 18:57:32,472 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionAttributteListener] (default task-11) Attribute added : __MessageStoreInterceptor_ActionErrors_SessionKey : [] session: gnKJYYsOL6U-7z0vCaWAU4rCNc8d0ShPl36_9SoD source: io.undertow.servlet.spec.HttpSessionImpl@48d965a5
2015-10-02 18:57:32,472 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionAttributteListener] (default task-11) Attribute added : __MessageStoreInterceptor_ActionMessages_SessionKey : [] session: gnKJYYsOL6U-7z0vCaWAU4rCNc8d0ShPl36_9SoD source: io.undertow.servlet.spec.HttpSessionImpl@48d965a5
2015-10-02 18:57:32,473 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionAttributteListener] (default task-11) Attribute added : __MessageStoreInterceptor_FieldErrors_SessionKey : {} session: gnKJYYsOL6U-7z0vCaWAU4rCNc8d0ShPl36_9SoD source: io.undertow.servlet.spec.HttpSessionImpl@48d965a5
2015-10-02 18:57:32,526 DEBUG [cz.cmhb.portal.service.security.remoting.SessionSecurityContextHolderSetterFilter] (default task-12) Process URI /home-page(isUriSecure=false)
2015-10-02 18:57:32,526 DEBUG [cz.cmhb.portal.service.security.remoting.SessionSecurityContextHolderSetterFilter] (default task-12) GET: Session id = gnKJYYsOL6U-7z0vCaWAU4rCNc8d0ShPl36_9SoD
2015-10-02 18:57:32,527 DEBUG [cz.cmhb.portal.service.security.remoting.SessionSecurityContextHolderSetterFilter] (default task-12) securityContext is NULL, session id = gnKJYYsOL6U-7z0vCaWAU4rCNc8d0ShPl36_9SoD
2015-10-02 18:57:32,527 ERROR [cz.cmhb.portal.service.security.remoting.SessionSecurityContextHolderSetterFilter] (default task-12) Unauthorized access, you must login before
2015-10-02 18:57:32,528 DEBUG [cz.cmhb.portal.service.security.remoting.SessionSecurityContextHolderSetterFilter] (default task-12) Sending redirect = /informatorium/login?backUrl=/informatorium/home-page
2015-10-02 18:57:32,532 TRACE [org.wildfly.clustering.web.infinispan] (default task-12) Session gnKJYYsOL6U-7z0vCaWAU4rCNc8d0ShPl36_9SoD will expire in 120000 ms
2015-10-02 18:57:32,596 DEBUG [cz.cmhb.portal.service.security.remoting.SessionSecurityContextHolderSetterFilter] (default task-13) Process URI /login(isUriSecure=true)
2015-10-02 18:57:32,597 DEBUG [cz.cmhb.portal.service.security.remoting.SessionSecurityContextHolderSetterFilter] (default task-13) GET: Session id = gnKJYYsOL6U-7z0vCaWAU4rCNc8d0ShPl36_9SoD
2015-10-02 18:57:32,597 DEBUG [cz.cmhb.portal.service.security.remoting.SessionSecurityContextHolderSetterFilter] (default task-13) securityContext is NULL, session id = gnKJYYsOL6U-7z0vCaWAU4rCNc8d0ShPl36_9SoD
2015-10-02 18:57:32,848 TRACE [org.wildfly.clustering.web.infinispan] (default task-13) Session gnKJYYsOL6U-7z0vCaWAU4rCNc8d0ShPl36_9SoD will expire in 120000 ms
{noformat}
Than I tried this configuration:
{noformat}
<cache-container name="web" default-cache="repl" module="org.wildfly.clustering.web.infinispan">
<transport lock-timeout="60000"/>
<replicated-cache name="repl" mode="SYNC">
<locking isolation="REPEATABLE_READ"/>
<transaction locking="PESSIMISTIC"/>
<file-store/>
</replicated-cache>
</cache-container>
{noformat}
and again the same:
{noformat}
2015-10-02 19:02:56,600 DEBUG [cz.cmhb.portal.app.informatorium.web.login.actions.DoLoginAction] (default task-8) Login action -> create new session: mA_LORNxTC-qFhN7H0XT8Y6AsHvT-GbZuuDhAPD5
2015-10-02 19:02:56,601 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionAttributteListener] (default task-8) Attribute added : SecurityContext : cz.cmhb.portal.service.security.to.AuthenticationDetail@666d994d session: mA_LORNxTC-qFhN7H0XT8Y6AsHvT-GbZuuDhAPD5 source: io.undertow.servlet.spec.HttpSessionImpl@4788bf
2015-10-02 19:02:56,602 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionAttributteListener] (default task-8) Attribute added : MujTestovaciAttribut : JakozeMusiBytNaTeSessionPorad!!! session: mA_LORNxTC-qFhN7H0XT8Y6AsHvT-GbZuuDhAPD5 source: io.undertow.servlet.spec.HttpSessionImpl@4788bf
2015-10-02 19:02:56,607 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionAttributteListener] (default task-8) Attribute added : DebugSessionBindingListener : cz.cmhb.portal.app.informatorium.listener.DebugSessionBindingListener@5f1d7b66 session: mA_LORNxTC-qFhN7H0XT8Y6AsHvT-GbZuuDhAPD5 source: io.undertow.servlet.spec.HttpSessionImpl@4788bf
2015-10-02 19:02:56,608 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionBindingListener] (default task-8) Value bound : DebugSessionBindingListener : cz.cmhb.portal.app.informatorium.listener.DebugSessionBindingListener@5f1d7b66 session: mA_LORNxTC-qFhN7H0XT8Y6AsHvT-GbZuuDhAPD5 source: io.undertow.servlet.spec.HttpSessionImpl@4788bf
2015-10-02 19:02:56,608 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionAttributteListener] (default task-8) Attribute added : DebugSessionActivationListener : cz.cmhb.portal.app.informatorium.listener.DebugSessionActivationListener@26571acf session: mA_LORNxTC-qFhN7H0XT8Y6AsHvT-GbZuuDhAPD5 source: io.undertow.servlet.spec.HttpSessionImpl@4788bf
2015-10-02 19:02:56,608 DEBUG [cz.cmhb.portal.app.informatorium.web.login.actions.DoLoginAction] (default task-8) PUT: Session id = mA_LORNxTC-qFhN7H0XT8Y6AsHvT-GbZuuDhAPD5
2015-10-02 19:02:56,608 DEBUG [cz.cmhb.portal.app.informatorium.web.login.actions.DoLoginAction] (default task-8) Attr: DebugSessionBindingListener cz.cmhb.portal.app.informatorium.listener.DebugSessionBindingListener@5f1d7b66
2015-10-02 19:02:56,608 DEBUG [cz.cmhb.portal.app.informatorium.web.login.actions.DoLoginAction] (default task-8) Attr: DebugSessionActivationListener cz.cmhb.portal.app.informatorium.listener.DebugSessionActivationListener@26571acf
2015-10-02 19:02:56,608 DEBUG [cz.cmhb.portal.app.informatorium.web.login.actions.DoLoginAction] (default task-8) Attr: SecurityContext cz.cmhb.portal.service.security.to.AuthenticationDetail@666d994d
2015-10-02 19:02:56,608 DEBUG [cz.cmhb.portal.app.informatorium.web.login.actions.DoLoginAction] (default task-8) Attr: MujTestovaciAttribut JakozeMusiBytNaTeSessionPorad!!!
2015-10-02 19:02:56,617 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionActivationListener] (default task-8) Passivate session: mA_LORNxTC-qFhN7H0XT8Y6AsHvT-GbZuuDhAPD5 source: org.wildfly.clustering.web.session.ImmutableHttpSessionAdapter@2c7a48b9
2015-10-02 19:02:56,617 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionActivationListener] (default task-8) Attr: DebugSessionBindingListener cz.cmhb.portal.app.informatorium.listener.DebugSessionBindingListener@5f1d7b66
2015-10-02 19:02:56,618 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionActivationListener] (default task-8) Attr: DebugSessionActivationListener cz.cmhb.portal.app.informatorium.listener.DebugSessionActivationListener@26571acf
2015-10-02 19:02:56,618 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionActivationListener] (default task-8) Attr: SecurityContext cz.cmhb.portal.service.security.to.AuthenticationDetail@666d994d
2015-10-02 19:02:56,618 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionActivationListener] (default task-8) Attr: MujTestovaciAttribut JakozeMusiBytNaTeSessionPorad!!!
2015-10-02 19:02:56,619 TRACE [org.wildfly.clustering.web.infinispan] (default task-8) Session mA_LORNxTC-qFhN7H0XT8Y6AsHvT-GbZuuDhAPD5 will expire in 120000 ms
2015-10-02 19:02:56,622 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionAttributteListener] (default task-8) Attribute added : __MessageStoreInterceptor_ActionErrors_SessionKey : [] session: mA_LORNxTC-qFhN7H0XT8Y6AsHvT-GbZuuDhAPD5 source: io.undertow.servlet.spec.HttpSessionImpl@4788bf
2015-10-02 19:02:56,622 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionAttributteListener] (default task-8) Attribute added : __MessageStoreInterceptor_ActionMessages_SessionKey : [] session: mA_LORNxTC-qFhN7H0XT8Y6AsHvT-GbZuuDhAPD5 source: io.undertow.servlet.spec.HttpSessionImpl@4788bf
2015-10-02 19:02:56,623 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionAttributteListener] (default task-8) Attribute added : __MessageStoreInterceptor_FieldErrors_SessionKey : {} session: mA_LORNxTC-qFhN7H0XT8Y6AsHvT-GbZuuDhAPD5 source: io.undertow.servlet.spec.HttpSessionImpl@4788bf
2015-10-02 19:02:56,727 DEBUG [cz.cmhb.portal.service.security.remoting.SessionSecurityContextHolderSetterFilter] (default task-9) Process URI /home-page(isUriSecure=false)
2015-10-02 19:02:56,727 DEBUG [cz.cmhb.portal.service.security.remoting.SessionSecurityContextHolderSetterFilter] (default task-9) GET: Session id = mA_LORNxTC-qFhN7H0XT8Y6AsHvT-GbZuuDhAPD5
2015-10-02 19:02:56,727 DEBUG [cz.cmhb.portal.service.security.remoting.SessionSecurityContextHolderSetterFilter] (default task-9) securityContext is NULL, session id = mA_LORNxTC-qFhN7H0XT8Y6AsHvT-GbZuuDhAPD5
2015-10-02 19:02:56,727 ERROR [cz.cmhb.portal.service.security.remoting.SessionSecurityContextHolderSetterFilter] (default task-9) Unauthorized access, you must login before
2015-10-02 19:02:56,728 DEBUG [cz.cmhb.portal.service.security.remoting.SessionSecurityContextHolderSetterFilter] (default task-9) Sending redirect = /informatorium/login?backUrl=/informatorium/home-page
2015-10-02 19:02:56,734 TRACE [org.wildfly.clustering.web.infinispan] (default task-9) Session mA_LORNxTC-qFhN7H0XT8Y6AsHvT-GbZuuDhAPD5 will expire in 120000 ms
2015-10-02 19:02:56,919 DEBUG [cz.cmhb.portal.service.security.remoting.SessionSecurityContextHolderSetterFilter] (default task-10) Process URI /login(isUriSecure=true)
2015-10-02 19:02:56,920 DEBUG [cz.cmhb.portal.service.security.remoting.SessionSecurityContextHolderSetterFilter] (default task-10) GET: Session id = mA_LORNxTC-qFhN7H0XT8Y6AsHvT-GbZuuDhAPD5
2015-10-02 19:02:56,920 DEBUG [cz.cmhb.portal.service.security.remoting.SessionSecurityContextHolderSetterFilter] (default task-10) securityContext is NULL, session id = mA_LORNxTC-qFhN7H0XT8Y6AsHvT-GbZuuDhAPD5
2015-10-02 19:02:57,057 TRACE [org.wildfly.clustering.web.infinispan] (default task-10) Session mA_LORNxTC-qFhN7H0XT8Y6AsHvT-GbZuuDhAPD5 will expire in 120000 ms
{noformat}
When I tried to use dist cache (and here I tried all configuration combination)
{noformat}
<cache-container name="web" default-cache="dist" module="org.wildfly.clustering.web.infinispan">
<transport lock-timeout="60000"/>
<distributed-cache name="dist" mode="ASYNC" owners="2" l1-lifespan="0">
<transaction mode="BATCH"/>
<file-store/>
</distributed-cache>
</cache-container>
{noformat}
except NONE (which I think means, that there will be NOT working failover) it always ends during logout with exception.
{noformat}
2015-10-02 13:28:57,941 ERROR [io.undertow.request] (default task-14) UT005023: Exception handling request to /informatorium/doLogout: java.lang.IllegalStateException: Transaction DummyTransaction{xid=DummyXid{id=22}, status=3} is not in a valid state to be invoking cache operations on.
at org.infinispan.interceptors.TxInterceptor.enlist(TxInterceptor.java:388)
at org.infinispan.interceptors.TxInterceptor.enlistWriteAndInvokeNext(TxInterceptor.java:357)
at org.infinispan.interceptors.TxInterceptor.visitRemoveCommand(TxInterceptor.java:230)
at org.infinispan.commands.write.RemoveCommand.acceptVisitor(RemoveCommand.java:59)
at org.infinispan.interceptors.base.CommandInterceptor.invokeNextInterceptor(CommandInterceptor.java:99)
at org.infinispan.interceptors.base.CommandInterceptor.handleDefault(CommandInterceptor.java:113)
at org.infinispan.commands.AbstractVisitor.visitRemoveCommand(AbstractVisitor.java:48)
at org.infinispan.commands.write.RemoveCommand.acceptVisitor(RemoveCommand.java:59)
at org.infinispan.interceptors.base.CommandInterceptor.invokeNextInterceptor(CommandInterceptor.java:99)
at org.infinispan.statetransfer.StateTransferInterceptor.handleTxWriteCommand(StateTransferInterceptor.java:304)
at org.infinispan.statetransfer.StateTransferInterceptor.handleWriteCommand(StateTransferInterceptor.java:286)
at org.infinispan.statetransfer.StateTransferInterceptor.visitRemoveCommand(StateTransferInterceptor.java:123)
at org.infinispan.commands.write.RemoveCommand.acceptVisitor(RemoveCommand.java:59)
at org.infinispan.interceptors.base.CommandInterceptor.invokeNextInterceptor(CommandInterceptor.java:99)
at org.infinispan.interceptors.CacheMgmtInterceptor.visitRemoveCommand(CacheMgmtInterceptor.java:209)
at org.infinispan.commands.write.RemoveCommand.acceptVisitor(RemoveCommand.java:59)
at org.infinispan.interceptors.base.CommandInterceptor.invokeNextInterceptor(CommandInterceptor.java:99)
at org.infinispan.interceptors.InvocationContextInterceptor.handleAll(InvocationContextInterceptor.java:102)
at org.infinispan.interceptors.InvocationContextInterceptor.handleDefault(InvocationContextInterceptor.java:71)
at org.infinispan.commands.AbstractVisitor.visitRemoveCommand(AbstractVisitor.java:48)
at org.infinispan.commands.write.RemoveCommand.acceptVisitor(RemoveCommand.java:59)
at org.infinispan.interceptors.base.CommandInterceptor.invokeNextInterceptor(CommandInterceptor.java:99)
at org.infinispan.interceptors.base.CommandInterceptor.handleDefault(CommandInterceptor.java:113)
at org.infinispan.commands.AbstractVisitor.visitRemoveCommand(AbstractVisitor.java:48)
at org.infinispan.commands.write.RemoveCommand.acceptVisitor(RemoveCommand.java:59)
at org.infinispan.interceptors.InterceptorChain.invoke(InterceptorChain.java:336)
at org.infinispan.cache.impl.CacheImpl.executeCommandAndCommitIfNeeded(CacheImpl.java:1634)
at org.infinispan.cache.impl.CacheImpl.removeInternal(CacheImpl.java:558)
at org.infinispan.cache.impl.CacheImpl.remove(CacheImpl.java:549)
at org.infinispan.cache.impl.DecoratedCache.remove(DecoratedCache.java:452)
at org.infinispan.cache.impl.AbstractDelegatingCache.remove(AbstractDelegatingCache.java:296)
at org.wildfly.clustering.web.infinispan.session.coarse.CoarseSessionFactory.remove(CoarseSessionFactory.java:196)
at org.wildfly.clustering.web.infinispan.session.coarse.CoarseSessionFactory.remove(CoarseSessionFactory.java:66)
at org.wildfly.clustering.web.infinispan.session.InfinispanSession.invalidate(InfinispanSession.java:68)
at org.wildfly.clustering.web.infinispan.session.InfinispanSessionManager$SchedulableSession.invalidate(InfinispanSessionManager.java:438)
at org.wildfly.clustering.web.undertow.session.DistributableSession.invalidate(DistributableSession.java:176)
at io.undertow.servlet.spec.HttpSessionImpl.invalidate(HttpSessionImpl.java:199)
at cz.cmhb.portal.app.informatorium.filter.InformatoriumDoLogoutFilter.doFilter(InformatoriumDoLogoutFilter.java:67)
at io.undertow.servlet.core.ManagedFilter.doFilter(ManagedFilter.java:60)
at io.undertow.servlet.handlers.FilterHandler$FilterChainImpl.doFilter(FilterHandler.java:132)
at io.undertow.servlet.handlers.FilterHandler.handleRequest(FilterHandler.java:85)
at io.undertow.servlet.handlers.security.ServletSecurityRoleHandler.handleRequest(ServletSecurityRoleHandler.java:62)
at io.undertow.servlet.handlers.ServletDispatchingHandler.handleRequest(ServletDispatchingHandler.java:36)
at org.wildfly.extension.undertow.security.SecurityContextAssociationHandler.handleRequest(SecurityContextAssociationHandler.java:78)
at io.undertow.server.handlers.PredicateHandler.handleRequest(PredicateHandler.java:43)
at io.undertow.servlet.handlers.security.SSLInformationAssociationHandler.handleRequest(SSLInformationAssociationHandler.java:131)
at io.undertow.servlet.handlers.security.ServletAuthenticationCallHandler.handleRequest(ServletAuthenticationCallHandler.java:57)
at io.undertow.server.handlers.PredicateHandler.handleRequest(PredicateHandler.java:43)
at io.undertow.security.handlers.AbstractConfidentialityHandler.handleRequest(AbstractConfidentialityHandler.java:46)
at io.undertow.servlet.handlers.security.ServletConfidentialityConstraintHandler.handleRequest(ServletConfidentialityConstraintHandler.java:64)
at io.undertow.security.handlers.AuthenticationMechanismsHandler.handleRequest(AuthenticationMechanismsHandler.java:60)
at io.undertow.servlet.handlers.security.CachedAuthenticatedSessionHandler.handleRequest(CachedAuthenticatedSessionHandler.java:72)
at io.undertow.security.handlers.NotificationReceiverHandler.handleRequest(NotificationReceiverHandler.java:50)
at io.undertow.security.handlers.AbstractSecurityContextAssociationHandler.handleRequest(AbstractSecurityContextAssociationHandler.java:43)
at io.undertow.server.handlers.PredicateHandler.handleRequest(PredicateHandler.java:43)
at org.wildfly.extension.undertow.security.jacc.JACCContextIdHandler.handleRequest(JACCContextIdHandler.java:61)
at io.undertow.server.handlers.PredicateHandler.handleRequest(PredicateHandler.java:43)
at io.undertow.server.handlers.PredicateHandler.handleRequest(PredicateHandler.java:43)
at io.undertow.servlet.handlers.ServletInitialHandler.handleFirstRequest(ServletInitialHandler.java:284)
at io.undertow.servlet.handlers.ServletInitialHandler.dispatchRequest(ServletInitialHandler.java:263)
at io.undertow.servlet.handlers.ServletInitialHandler.access$000(ServletInitialHandler.java:81)
at io.undertow.servlet.handlers.ServletInitialHandler$1.handleRequest(ServletInitialHandler.java:174)
at io.undertow.server.Connectors.executeRootHandler(Connectors.java:198)
at io.undertow.server.HttpServerExchange$1.run(HttpServerExchange.java:784)
at java.util.concurrent.ThreadPoolExecutor.runWorker(ThreadPoolExecutor.java:1142)
at java.util.concurrent.ThreadPoolExecutor$Worker.run(ThreadPoolExecutor.java:617)
at java.lang.Thread.run(Thread.java:745)
{noformat}
> Lost data on session
> --------------------
>
> Key: WFLY-5444
> URL: https://issues.jboss.org/browse/WFLY-5444
> Project: WildFly
> Issue Type: Bug
> Components: Clustering
> Affects Versions: 9.0.1.Final
> Reporter: Petr Sígl
> Assignee: Paul Ferraro
> Priority: Critical
>
> Configuration - standalone-ha.xml:
> {noformat}
> <cache-container name="web" default-cache="repl" module="org.wildfly.clustering.web.infinispan">
> <transport lock-timeout="60000"/>
> <replicated-cache name="repl" mode="ASYNC">
> <locking isolation="READ_COMMITTED"/>
> <transaction locking="OPTIMISTIC"/>
> <file-store/>
> </replicated-cache>
> </cache-container>
> {noformat}
> Sometimes server "loose" data stored in session - after redirect. It happens when 2 (or more?) node are running. With 1 node we are not able to reproduce the error.
> Steps:
> First request
> - in login action we create new session
> - store security key in it
> - redirect to home-page
> Second request
> - check security key
> - process home-page
> -...
> From logs below (we are doing the same) you can see, that in "error" state there is no session activation and than there are no attributes on session.
> Working
> {noformat}
> 2015-10-01 14:44:47,611 DEBUG [cz.cmhb.portal.app.informatorium.web.login.actions.DoLoginAction] (default task-4) Login action -> create new session: 0LbLrPIhBPXlzqXn1aqVS_-38E33YeFW-Nf-wnD3
> 2015-10-01 14:44:47,614 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionAttributteListener] (default task-4) Attribute added : SecurityContext : cz.cmhb.portal.service.security.to.AuthenticationDetail@7d5aee75 session: 0LbLrPIhBPXlzqXn1aqVS_-38E33YeFW-Nf-wnD3 source: io.undertow.servlet.spec.HttpSessionImpl@482909ad
> 2015-10-01 14:44:47,615 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionAttributteListener] (default task-4) Attribute added : MujTestovaciAttribut : JakozeMusiBytNaTeSessionPorad!!! session: 0LbLrPIhBPXlzqXn1aqVS_-38E33YeFW-Nf-wnD3 source: io.undertow.servlet.spec.HttpSessionImpl@482909ad
> 2015-10-01 14:44:47,620 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionAttributteListener] (default task-4) Attribute added : DebugSessionBindingListener : cz.cmhb.portal.app.informatorium.listener.DebugSessionBindingListener@2662064a session: 0LbLrPIhBPXlzqXn1aqVS_-38E33YeFW-Nf-wnD3 source: io.undertow.servlet.spec.HttpSessionImpl@482909ad
> 2015-10-01 14:44:47,621 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionBindingListener] (default task-4) Value bound : DebugSessionBindingListener : cz.cmhb.portal.app.informatorium.listener.DebugSessionBindingListener@2662064a session: 0LbLrPIhBPXlzqXn1aqVS_-38E33YeFW-Nf-wnD3 source: io.undertow.servlet.spec.HttpSessionImpl@482909ad
> 2015-10-01 14:44:47,621 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionAttributteListener] (default task-4) Attribute added : DebugSessionActivationListener : cz.cmhb.portal.app.informatorium.listener.DebugSessionActivationListener@629b89a4 session: 0LbLrPIhBPXlzqXn1aqVS_-38E33YeFW-Nf-wnD3 source: io.undertow.servlet.spec.HttpSessionImpl@482909ad
> 2015-10-01 14:44:47,622 DEBUG [cz.cmhb.portal.app.informatorium.web.login.actions.DoLoginAction] (default task-4) PUT: Session id = 0LbLrPIhBPXlzqXn1aqVS_-38E33YeFW-Nf-wnD3
> 2015-10-01 14:44:47,625 DEBUG [cz.cmhb.portal.app.informatorium.web.login.actions.DoLoginAction] (default task-4) Attr: DebugSessionBindingListener cz.cmhb.portal.app.informatorium.listener.DebugSessionBindingListener@2662064a
> 2015-10-01 14:44:47,627 DEBUG [cz.cmhb.portal.app.informatorium.web.login.actions.DoLoginAction] (default task-4) Attr: DebugSessionActivationListener cz.cmhb.portal.app.informatorium.listener.DebugSessionActivationListener@629b89a4
> 2015-10-01 14:44:47,630 DEBUG [cz.cmhb.portal.app.informatorium.web.login.actions.DoLoginAction] (default task-4) Attr: SecurityContext cz.cmhb.portal.service.security.to.AuthenticationDetail@7d5aee75
> 2015-10-01 14:44:47,631 DEBUG [cz.cmhb.portal.app.informatorium.web.login.actions.DoLoginAction] (default task-4) Attr: MujTestovaciAttribut JakozeMusiBytNaTeSessionPorad!!!
> 2015-10-01 14:44:47,645 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionAttributteListener] (default task-4) Attribute added : SESSION_AFTER_LOGIN_ACTION : /home-page session: 0LbLrPIhBPXlzqXn1aqVS_-38E33YeFW-Nf-wnD3 source: io.undertow.servlet.spec.HttpSessionImpl@482909ad
> 2015-10-01 14:44:47,663 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionAttributteListener] (default task-4) Attribute removed : SESSION_AFTER_LOGIN_ACTION : /home-page session: 0LbLrPIhBPXlzqXn1aqVS_-38E33YeFW-Nf-wnD3 source: io.undertow.servlet.spec.HttpSessionImpl@482909ad
> 2015-10-01 14:44:47,669 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionActivationListener] (default task-4) Passivate session: 0LbLrPIhBPXlzqXn1aqVS_-38E33YeFW-Nf-wnD3 source: org.wildfly.clustering.web.session.ImmutableHttpSessionAdapter@53c97140
> 2015-10-01 14:44:47,670 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionActivationListener] (default task-4) Attr: DebugSessionBindingListener cz.cmhb.portal.app.informatorium.listener.DebugSessionBindingListener@2662064a
> 2015-10-01 14:44:47,673 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionActivationListener] (default task-4) Attr: DebugSessionActivationListener cz.cmhb.portal.app.informatorium.listener.DebugSessionActivationListener@629b89a4
> 2015-10-01 14:44:47,673 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionActivationListener] (default task-4) Attr: SecurityContext cz.cmhb.portal.service.security.to.AuthenticationDetail@7d5aee75
> 2015-10-01 14:44:47,674 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionActivationListener] (default task-4) Attr: MujTestovaciAttribut JakozeMusiBytNaTeSessionPorad!!!
> 2015-10-01 14:44:47,681 TRACE [org.wildfly.clustering.web.infinispan] (default task-4) Session 0LbLrPIhBPXlzqXn1aqVS_-38E33YeFW-Nf-wnD3 will expire in 120000 ms
> 2015-10-01 14:44:47,685 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionAttributteListener] (default task-4) Attribute added : __MessageStoreInterceptor_ActionErrors_SessionKey : [] session: 0LbLrPIhBPXlzqXn1aqVS_-38E33YeFW-Nf-wnD3 source: io.undertow.servlet.spec.HttpSessionImpl@482909ad
> 2015-10-01 14:44:47,686 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionAttributteListener] (default task-4) Attribute added : __MessageStoreInterceptor_ActionMessages_SessionKey : [] session: 0LbLrPIhBPXlzqXn1aqVS_-38E33YeFW-Nf-wnD3 source: io.undertow.servlet.spec.HttpSessionImpl@482909ad
> 2015-10-01 14:44:47,686 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionAttributteListener] (default task-4) Attribute added : __MessageStoreInterceptor_FieldErrors_SessionKey : {} session: 0LbLrPIhBPXlzqXn1aqVS_-38E33YeFW-Nf-wnD3 source: io.undertow.servlet.spec.HttpSessionImpl@482909ad
> 2015-10-01 14:44:47,813 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionActivationListener] (default task-5) Activate session: 0LbLrPIhBPXlzqXn1aqVS_-38E33YeFW-Nf-wnD3 source: org.wildfly.clustering.web.session.ImmutableHttpSessionAdapter@584a0879
> 2015-10-01 14:44:47,821 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionActivationListener] (default task-5) Attr: __MessageStoreInterceptor_ActionErrors_SessionKey []
> 2015-10-01 14:44:47,827 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionActivationListener] (default task-5) Attr: __MessageStoreInterceptor_FieldErrors_SessionKey {}
> 2015-10-01 14:44:47,835 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionActivationListener] (default task-5) Attr: DebugSessionBindingListener cz.cmhb.portal.app.informatorium.listener.DebugSessionBindingListener@2662064a
> 2015-10-01 14:44:47,839 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionActivationListener] (default task-5) Attr: DebugSessionActivationListener cz.cmhb.portal.app.informatorium.listener.DebugSessionActivationListener@629b89a4
> 2015-10-01 14:44:47,852 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionActivationListener] (default task-5) Attr: SecurityContext cz.cmhb.portal.service.security.to.AuthenticationDetail@7d5aee75
> 2015-10-01 14:44:47,855 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionActivationListener] (default task-5) Attr: __MessageStoreInterceptor_ActionMessages_SessionKey []
> 2015-10-01 14:44:47,856 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionActivationListener] (default task-5) Attr: MujTestovaciAttribut JakozeMusiBytNaTeSessionPorad!!!
> 2015-10-01 14:44:47,858 DEBUG [cz.cmhb.portal.service.security.remoting.SessionSecurityContextHolderSetterFilter] (default task-5) Process URI /home-page(isUriSecure=false)
> 2015-10-01 14:44:47,858 DEBUG [cz.cmhb.portal.service.security.remoting.SessionSecurityContextHolderSetterFilter] (default task-5) GET: Session id = 0LbLrPIhBPXlzqXn1aqVS_-38E33YeFW-Nf-wnD3
> 2015-10-01 14:44:47,862 DEBUG [cz.cmhb.portal.service.security.remoting.SessionSecurityContextHolderSetterFilter] (default task-5) Attr: __MessageStoreInterceptor_ActionErrors_SessionKey - []
> 2015-10-01 14:44:47,866 DEBUG [cz.cmhb.portal.service.security.remoting.SessionSecurityContextHolderSetterFilter] (default task-5) Attr: __MessageStoreInterceptor_FieldErrors_SessionKey - {}
> 2015-10-01 14:44:47,869 DEBUG [cz.cmhb.portal.service.security.remoting.SessionSecurityContextHolderSetterFilter] (default task-5) Attr: DebugSessionBindingListener - cz.cmhb.portal.app.informatorium.listener.DebugSessionBindingListener@2662064a
> 2015-10-01 14:44:47,872 DEBUG [cz.cmhb.portal.service.security.remoting.SessionSecurityContextHolderSetterFilter] (default task-5) Attr: DebugSessionActivationListener - cz.cmhb.portal.app.informatorium.listener.DebugSessionActivationListener@629b89a4
> 2015-10-01 14:44:47,876 DEBUG [cz.cmhb.portal.service.security.remoting.SessionSecurityContextHolderSetterFilter] (default task-5) Attr: SecurityContext - cz.cmhb.portal.service.security.to.AuthenticationDetail@7d5aee75
> 2015-10-01 14:44:47,879 DEBUG [cz.cmhb.portal.service.security.remoting.SessionSecurityContextHolderSetterFilter] (default task-5) Attr: __MessageStoreInterceptor_ActionMessages_SessionKey - []
> 2015-10-01 14:44:47,880 DEBUG [cz.cmhb.portal.service.security.remoting.SessionSecurityContextHolderSetterFilter] (default task-5) Attr: MujTestovaciAttribut - JakozeMusiBytNaTeSessionPorad!!!
> 2015-10-01 14:44:47,889 DEBUG [cz.cmhb.portal.service.security.remoting.SessionSecurityContextHolderSetterFilter] (default task-5) securityContext is NOT null, session id = 0LbLrPIhBPXlzqXn1aqVS_-38E33YeFW-Nf-wnD3
> 2015-10-01 14:44:47,890 DEBUG [cz.cmhb.portal.service.security.remoting.SessionSecurityContextHolderSetterFilter] (default task-5) isURIOk = true
> 2015-10-01 14:44:47,890 INFO [cz.cmhb.portal.service.security.remoting.SessionSecurityContextHolderSetterFilter] (pospisilikovahana:0LbLrPIhBPXlzqXn1aqVS_-38E33YeFW-Nf-wnD3) #REQUEST #BEGIN https://portaltst.hypotecnibanka.cz/informatorium/home-page
> 2015-10-01 14:44:47,939 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionAttributteListener] (pospisilikovahana:0LbLrPIhBPXlzqXn1aqVS_-38E33YeFW-Nf-wnD3) Attribute added : org.springframework.web.context.request.ServletRequestAttributes.DESTRUCTION_CALLBACK.scopedTarget.rights : org.springframework.web.context.request.DestructionCallbackBindingListener@132f2f64 session: 0LbLrPIhBPXlzqXn1aqVS_-38E33YeFW-Nf-wnD3 source: io.undertow.servlet.spec.HttpSessionImpl@4f4e5791
> 2015-10-01 14:44:47,942 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionAttributteListener] (pospisilikovahana:0LbLrPIhBPXlzqXn1aqVS_-38E33YeFW-Nf-wnD3) Attribute added : scopedTarget.rights : cz.cmhb.portal.app.informatorium.web.Rights@5ad5ce79 session: 0LbLrPIhBPXlzqXn1aqVS_-38E33YeFW-Nf-wnD3 source: io.undertow.servlet.spec.HttpSessionImpl@4f4e5791
> 2015-10-01 14:44:47,958 DEBUG [cz.cmhb.portal.service.security.remoting.AuthenticationSimpleHttpInvokerRequestExecutor] (pospisilikovahana:0LbLrPIhBPXlzqXn1aqVS_-38E33YeFW-Nf-wnD3) Sending HTTP invoker request for service at [http://phspa1tst/informatorium-remote/remote/informatoriumAuthorizationSe...], with size 595
> 2015-10-01 14:44:47,963 DEBUG [cz.cmhb.portal.service.security.remoting.AuthenticationSimpleHttpInvokerRequestExecutor] (pospisilikovahana:0LbLrPIhBPXlzqXn1aqVS_-38E33YeFW-Nf-wnD3) Sending securityContext of externalContractId=1410 for session 0LbLrPIhBPXlzqXn1aqVS_-38E33YeFW-Nf-wnD3
> 2015-10-01 14:44:48,104 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionAttributteListener] (pospisilikovahana:0LbLrPIhBPXlzqXn1aqVS_-38E33YeFW-Nf-wnD3) Attribute removed : __MessageStoreInterceptor_ActionErrors_SessionKey : [] session: 0LbLrPIhBPXlzqXn1aqVS_-38E33YeFW-Nf-wnD3 source: io.undertow.servlet.spec.HttpSessionImpl@4f4e5791
> 2015-10-01 14:44:48,122 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionAttributteListener] (pospisilikovahana:0LbLrPIhBPXlzqXn1aqVS_-38E33YeFW-Nf-wnD3) Attribute removed : __MessageStoreInterceptor_ActionMessages_SessionKey : [] session: 0LbLrPIhBPXlzqXn1aqVS_-38E33YeFW-Nf-wnD3 source: io.undertow.servlet.spec.HttpSessionImpl@4f4e5791
> 2015-10-01 14:44:48,126 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionAttributteListener] (pospisilikovahana:0LbLrPIhBPXlzqXn1aqVS_-38E33YeFW-Nf-wnD3) Attribute removed : __MessageStoreInterceptor_FieldErrors_SessionKey : {} session: 0LbLrPIhBPXlzqXn1aqVS_-38E33YeFW-Nf-wnD3 source: io.undertow.servlet.spec.HttpSessionImpl@4f4e5791
> 2015-10-01 14:44:48,127 DEBUG [cz.cmhb.portal.service.security.remoting.AuthenticationSimpleHttpInvokerRequestExecutor] (pospisilikovahana:0LbLrPIhBPXlzqXn1aqVS_-38E33YeFW-Nf-wnD3) Sending HTTP invoker request for service at [http://phspa1tst/informatorium-remote/remote/informatoriumDocumentService], with size 310
> 2015-10-01 14:44:48,128 DEBUG [cz.cmhb.portal.service.security.remoting.AuthenticationSimpleHttpInvokerRequestExecutor] (pospisilikovahana:0LbLrPIhBPXlzqXn1aqVS_-38E33YeFW-Nf-wnD3) Sending securityContext of externalContractId=1410 for session 0LbLrPIhBPXlzqXn1aqVS_-38E33YeFW-Nf-wnD3
> 2015-10-01 14:44:48,187 DEBUG [cz.cmhb.portal.service.security.remoting.AuthenticationSimpleHttpInvokerRequestExecutor] (pospisilikovahana:0LbLrPIhBPXlzqXn1aqVS_-38E33YeFW-Nf-wnD3) Sending HTTP invoker request for service at [http://phspa1tst/informatorium-remote/remote/informatoriumDocumentService], with size 449
> 2015-10-01 14:44:48,190 DEBUG [cz.cmhb.portal.service.security.remoting.AuthenticationSimpleHttpInvokerRequestExecutor] (pospisilikovahana:0LbLrPIhBPXlzqXn1aqVS_-38E33YeFW-Nf-wnD3) Sending securityContext of externalContractId=1410 for session 0LbLrPIhBPXlzqXn1aqVS_-38E33YeFW-Nf-wnD3
> 2015-10-01 14:44:48,287 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionAttributteListener] (pospisilikovahana:0LbLrPIhBPXlzqXn1aqVS_-38E33YeFW-Nf-wnD3) Attribute added : org.springframework.web.context.request.ServletRequestAttributes.DESTRUCTION_CALLBACK.scopedTarget.idPreviewModel : org.springframework.web.context.request.DestructionCallbackBindingListener@6b04e322 session: 0LbLrPIhBPXlzqXn1aqVS_-38E33YeFW-Nf-wnD3 source: io.undertow.servlet.spec.HttpSessionImpl@4f4e5791
> 2015-10-01 14:44:48,292 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionAttributteListener] (pospisilikovahana:0LbLrPIhBPXlzqXn1aqVS_-38E33YeFW-Nf-wnD3) Attribute added : scopedTarget.idPreviewModel : cz.cmhb.portal.app.informatorium.web.preview.IdPreviewModel@a2201d4 session: 0LbLrPIhBPXlzqXn1aqVS_-38E33YeFW-Nf-wnD3 source: io.undertow.servlet.spec.HttpSessionImpl@4f4e5791
> 2015-10-01 14:44:48,320 DEBUG [cz.cmhb.portal.service.security.remoting.AuthenticationSimpleHttpInvokerRequestExecutor] (pospisilikovahana:0LbLrPIhBPXlzqXn1aqVS_-38E33YeFW-Nf-wnD3) Sending HTTP invoker request for service at [http://phspa1tst/informatorium-remote/remote/informatoriumDocumentService], with size 502
> 2015-10-01 14:44:48,327 DEBUG [cz.cmhb.portal.service.security.remoting.AuthenticationSimpleHttpInvokerRequestExecutor] (pospisilikovahana:0LbLrPIhBPXlzqXn1aqVS_-38E33YeFW-Nf-wnD3) Sending securityContext of externalContractId=1410 for session 0LbLrPIhBPXlzqXn1aqVS_-38E33YeFW-Nf-wnD3
> 2015-10-01 14:44:48,640 DEBUG [cz.cmhb.portal.service.security.remoting.AuthenticationSimpleHttpInvokerRequestExecutor] (pospisilikovahana:0LbLrPIhBPXlzqXn1aqVS_-38E33YeFW-Nf-wnD3) Sending HTTP invoker request for service at [http://phspa1tst/informatorium-remote/remote/informatoriumDocumentService], with size 497
> 2015-10-01 14:44:48,642 DEBUG [cz.cmhb.portal.service.security.remoting.AuthenticationSimpleHttpInvokerRequestExecutor] (pospisilikovahana:0LbLrPIhBPXlzqXn1aqVS_-38E33YeFW-Nf-wnD3) Sending securityContext of externalContractId=1410 for session 0LbLrPIhBPXlzqXn1aqVS_-38E33YeFW-Nf-wnD3
> 2015-10-01 14:44:48,718 DEBUG [cz.cmhb.portal.service.security.remoting.AuthenticationSimpleHttpInvokerRequestExecutor] (pospisilikovahana:0LbLrPIhBPXlzqXn1aqVS_-38E33YeFW-Nf-wnD3) Sending HTTP invoker request for service at [http://phspa1tst/informatorium-remote/remote/informatoriumDocumentService], with size 453
> 2015-10-01 14:44:48,720 DEBUG [cz.cmhb.portal.service.security.remoting.AuthenticationSimpleHttpInvokerRequestExecutor] (pospisilikovahana:0LbLrPIhBPXlzqXn1aqVS_-38E33YeFW-Nf-wnD3) Sending securityContext of externalContractId=1410 for session 0LbLrPIhBPXlzqXn1aqVS_-38E33YeFW-Nf-wnD3
> 2015-10-01 14:44:48,770 DEBUG [cz.cmhb.portal.service.security.remoting.AuthenticationSimpleHttpInvokerRequestExecutor] (pospisilikovahana:0LbLrPIhBPXlzqXn1aqVS_-38E33YeFW-Nf-wnD3) Sending HTTP invoker request for service at [http://phspa1tst/informatorium-remote/remote/informatoriumDocumentService], with size 501
> 2015-10-01 14:44:48,771 DEBUG [cz.cmhb.portal.service.security.remoting.AuthenticationSimpleHttpInvokerRequestExecutor] (pospisilikovahana:0LbLrPIhBPXlzqXn1aqVS_-38E33YeFW-Nf-wnD3) Sending securityContext of externalContractId=1410 for session 0LbLrPIhBPXlzqXn1aqVS_-38E33YeFW-Nf-wnD3
> 2015-10-01 14:44:48,994 DEBUG [cz.cmhb.portal.service.security.remoting.AuthenticationSimpleHttpInvokerRequestExecutor] (pospisilikovahana:0LbLrPIhBPXlzqXn1aqVS_-38E33YeFW-Nf-wnD3) Sending HTTP invoker request for service at [http://phspa1tst/informatorium-remote/remote/informatoriumSelectBrandService], with size 315
> 2015-10-01 14:44:48,996 DEBUG [cz.cmhb.portal.service.security.remoting.AuthenticationSimpleHttpInvokerRequestExecutor] (pospisilikovahana:0LbLrPIhBPXlzqXn1aqVS_-38E33YeFW-Nf-wnD3) Sending securityContext of externalContractId=1410 for session 0LbLrPIhBPXlzqXn1aqVS_-38E33YeFW-Nf-wnD3
> 2015-10-01 14:44:49,073 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionAttributteListener] (pospisilikovahana:0LbLrPIhBPXlzqXn1aqVS_-38E33YeFW-Nf-wnD3) Attribute added : org.springframework.web.context.request.ServletRequestAttributes.DESTRUCTION_CALLBACK.scopedTarget.homePageModel : org.springframework.web.context.request.DestructionCallbackBindingListener@1250ad83 session: 0LbLrPIhBPXlzqXn1aqVS_-38E33YeFW-Nf-wnD3 source: io.undertow.servlet.spec.HttpSessionImpl@4f4e5791
> 2015-10-01 14:44:49,087 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionAttributteListener] (pospisilikovahana:0LbLrPIhBPXlzqXn1aqVS_-38E33YeFW-Nf-wnD3) Attribute added : scopedTarget.homePageModel : cz.cmhb.portal.app.informatorium.web.homepage.HomePageModel@78932822 session: 0LbLrPIhBPXlzqXn1aqVS_-38E33YeFW-Nf-wnD3 source: io.undertow.servlet.spec.HttpSessionImpl@4f4e5791
> 2015-10-01 14:44:49,141 DEBUG [cz.cmhb.portal.service.security.remoting.AuthenticationSimpleHttpInvokerRequestExecutor] (pospisilikovahana:0LbLrPIhBPXlzqXn1aqVS_-38E33YeFW-Nf-wnD3) Sending HTTP invoker request for service at [http://phspa1tst/informatorium-remote/remote/informatoriumProfilService], with size 305
> 2015-10-01 14:44:49,151 DEBUG [cz.cmhb.portal.service.security.remoting.AuthenticationSimpleHttpInvokerRequestExecutor] (pospisilikovahana:0LbLrPIhBPXlzqXn1aqVS_-38E33YeFW-Nf-wnD3) Sending securityContext of externalContractId=1410 for session 0LbLrPIhBPXlzqXn1aqVS_-38E33YeFW-Nf-wnD3
> 2015-10-01 14:44:49,291 DEBUG [cz.cmhb.portal.service.security.remoting.AuthenticationSimpleHttpInvokerRequestExecutor] (pospisilikovahana:0LbLrPIhBPXlzqXn1aqVS_-38E33YeFW-Nf-wnD3) Sending HTTP invoker request for service at [http://phspa1tst/informatorium-remote/remote/informatoriumProfilService], with size 302
> 2015-10-01 14:44:49,292 DEBUG [cz.cmhb.portal.service.security.remoting.AuthenticationSimpleHttpInvokerRequestExecutor] (pospisilikovahana:0LbLrPIhBPXlzqXn1aqVS_-38E33YeFW-Nf-wnD3) Sending securityContext of externalContractId=1410 for session 0LbLrPIhBPXlzqXn1aqVS_-38E33YeFW-Nf-wnD3
> 2015-10-01 14:44:49,338 DEBUG [cz.cmhb.portal.service.security.remoting.AuthenticationSimpleHttpInvokerRequestExecutor] (pospisilikovahana:0LbLrPIhBPXlzqXn1aqVS_-38E33YeFW-Nf-wnD3) Sending HTTP invoker request for service at [http://phspa1tst/informatorium-remote/remote/informatoriumProfilService], with size 316
> 2015-10-01 14:44:49,339 DEBUG [cz.cmhb.portal.service.security.remoting.AuthenticationSimpleHttpInvokerRequestExecutor] (pospisilikovahana:0LbLrPIhBPXlzqXn1aqVS_-38E33YeFW-Nf-wnD3) Sending securityContext of externalContractId=1410 for session 0LbLrPIhBPXlzqXn1aqVS_-38E33YeFW-Nf-wnD3
> 2015-10-01 14:44:49,534 DEBUG [cz.cmhb.portal.service.security.remoting.AuthenticationSimpleHttpInvokerRequestExecutor] (pospisilikovahana:0LbLrPIhBPXlzqXn1aqVS_-38E33YeFW-Nf-wnD3) Sending HTTP invoker request for service at [http://phspa1tst/informatorium-remote/remote/informatoriumProfilService], with size 310
> 2015-10-01 14:44:49,535 DEBUG [cz.cmhb.portal.service.security.remoting.AuthenticationSimpleHttpInvokerRequestExecutor] (pospisilikovahana:0LbLrPIhBPXlzqXn1aqVS_-38E33YeFW-Nf-wnD3) Sending securityContext of externalContractId=1410 for session 0LbLrPIhBPXlzqXn1aqVS_-38E33YeFW-Nf-wnD3
> 2015-10-01 14:44:49,954 INFO [cz.cmhb.portal.service.security.remoting.SessionSecurityContextHolderSetterFilter] (pospisilikovahana:0LbLrPIhBPXlzqXn1aqVS_-38E33YeFW-Nf-wnD3) #REQUEST #END:2096 https://portaltst.hypotecnibanka.cz/informatorium/home-page
> 2015-10-01 14:44:49,989 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionActivationListener] (default task-5) Passivate session: 0LbLrPIhBPXlzqXn1aqVS_-38E33YeFW-Nf-wnD3 source: org.wildfly.clustering.web.session.ImmutableHttpSessionAdapter@652bc07e
> 2015-10-01 14:44:49,991 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionActivationListener] (default task-5) Attr: scopedTarget.idPreviewModel cz.cmhb.portal.app.informatorium.web.preview.IdPreviewModel@a2201d4
> 2015-10-01 14:44:49,994 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionActivationListener] (default task-5) Attr: DebugSessionBindingListener cz.cmhb.portal.app.informatorium.listener.DebugSessionBindingListener@2662064a
> 2015-10-01 14:44:49,997 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionActivationListener] (default task-5) Attr: org.springframework.web.context.request.ServletRequestAttributes.DESTRUCTION_CALLBACK.scopedTarget.rights org.springframework.web.context.request.DestructionCallbackBindingListener@132f2f64
> 2015-10-01 14:44:50,002 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionActivationListener] (default task-5) Attr: scopedTarget.homePageModel cz.cmhb.portal.app.informatorium.web.homepage.HomePageModel@78932822
> 2015-10-01 14:44:50,004 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionActivationListener] (default task-5) Attr: DebugSessionActivationListener cz.cmhb.portal.app.informatorium.listener.DebugSessionActivationListener@629b89a4
> 2015-10-01 14:44:50,008 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionActivationListener] (default task-5) Attr: SecurityContext cz.cmhb.portal.service.security.to.AuthenticationDetail@7d5aee75
> 2015-10-01 14:44:50,010 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionActivationListener] (default task-5) Attr: org.springframework.web.context.request.ServletRequestAttributes.DESTRUCTION_CALLBACK.scopedTarget.homePageModel org.springframework.web.context.request.DestructionCallbackBindingListener@1250ad83
> 2015-10-01 14:44:50,010 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionActivationListener] (default task-5) Attr: MujTestovaciAttribut JakozeMusiBytNaTeSessionPorad!!!
> 2015-10-01 14:44:50,014 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionActivationListener] (default task-5) Attr: scopedTarget.rights cz.cmhb.portal.app.informatorium.web.Rights@5ad5ce79
> 2015-10-01 14:44:50,016 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionActivationListener] (default task-5) Attr: org.springframework.web.context.request.ServletRequestAttributes.DESTRUCTION_CALLBACK.scopedTarget.idPreviewModel org.springframework.web.context.request.DestructionCallbackBindingListener@6b04e322
> 2015-10-01 14:44:50,017 TRACE [org.wildfly.clustering.web.infinispan] (default task-5) Session 0LbLrPIhBPXlzqXn1aqVS_-38E33YeFW-Nf-wnD3 will expire in 120000 ms
> 2015-10-01 14:44:50,720 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionActivationListener] (default task-6) Activate session: 0LbLrPIhBPXlzqXn1aqVS_-38E33YeFW-Nf-wnD3 source: org.wildfly.clustering.web.session.ImmutableHttpSessionAdapter@19bf94c0
> 2015-10-01 14:44:50,731 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionActivationListener] (default task-6) Attr: scopedTarget.idPreviewModel cz.cmhb.portal.app.informatorium.web.preview.IdPreviewModel@a2201d4
> 2015-10-01 14:44:50,742 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionActivationListener] (default task-6) Attr: DebugSessionBindingListener cz.cmhb.portal.app.informatorium.listener.DebugSessionBindingListener@2662064a
> 2015-10-01 14:44:50,754 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionActivationListener] (default task-6) Attr: org.springframework.web.context.request.ServletRequestAttributes.DESTRUCTION_CALLBACK.scopedTarget.rights org.springframework.web.context.request.DestructionCallbackBindingListener@132f2f64
> 2015-10-01 14:44:50,768 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionActivationListener] (default task-6) Attr: scopedTarget.homePageModel cz.cmhb.portal.app.informatorium.web.homepage.HomePageModel@78932822
> 2015-10-01 14:44:50,772 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionActivationListener] (default task-6) Attr: DebugSessionActivationListener cz.cmhb.portal.app.informatorium.listener.DebugSessionActivationListener@629b89a4
> 2015-10-01 14:44:50,775 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionActivationListener] (default task-6) Attr: SecurityContext cz.cmhb.portal.service.security.to.AuthenticationDetail@7d5aee75
> 2015-10-01 14:44:50,793 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionActivationListener] (default task-6) Attr: org.springframework.web.context.request.ServletRequestAttributes.DESTRUCTION_CALLBACK.scopedTarget.homePageModel org.springframework.web.context.request.DestructionCallbackBindingListener@1250ad83
> 2015-10-01 14:44:50,794 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionActivationListener] (default task-6) Attr: MujTestovaciAttribut JakozeMusiBytNaTeSessionPorad!!!
> 2015-10-01 14:44:50,798 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionActivationListener] (default task-6) Attr: scopedTarget.rights cz.cmhb.portal.app.informatorium.web.Rights@5ad5ce79
> 2015-10-01 14:44:50,826 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionActivationListener] (default task-6) Attr: org.springframework.web.context.request.ServletRequestAttributes.DESTRUCTION_CALLBACK.scopedTarget.idPreviewModel org.springframework.web.context.request.DestructionCallbackBindingListener@6b04e322
> 2015-10-01 14:44:50,828 DEBUG [cz.cmhb.portal.service.security.remoting.SessionSecurityContextHolderSetterFilter] (default task-6) Process URI /banner(isUriSecure=false)
> 2015-10-01 14:44:50,829 DEBUG [cz.cmhb.portal.service.security.remoting.SessionSecurityContextHolderSetterFilter] (default task-6) GET: Session id = 0LbLrPIhBPXlzqXn1aqVS_-38E33YeFW-Nf-wnD3
> 2015-10-01 14:44:50,832 DEBUG [cz.cmhb.portal.service.security.remoting.SessionSecurityContextHolderSetterFilter] (default task-6) Attr: scopedTarget.idPreviewModel - cz.cmhb.portal.app.informatorium.web.preview.IdPreviewModel@a2201d4
> 2015-10-01 14:44:50,835 DEBUG [cz.cmhb.portal.service.security.remoting.SessionSecurityContextHolderSetterFilter] (default task-6) Attr: DebugSessionBindingListener - cz.cmhb.portal.app.informatorium.listener.DebugSessionBindingListener@2662064a
> 2015-10-01 14:44:50,842 DEBUG [cz.cmhb.portal.service.security.remoting.SessionSecurityContextHolderSetterFilter] (default task-6) Attr: org.springframework.web.context.request.ServletRequestAttributes.DESTRUCTION_CALLBACK.scopedTarget.rights - org.springframework.web.context.request.DestructionCallbackBindingListener@132f2f64
> 2015-10-01 14:44:50,856 DEBUG [cz.cmhb.portal.service.security.remoting.SessionSecurityContextHolderSetterFilter] (default task-6) Attr: scopedTarget.homePageModel - cz.cmhb.portal.app.informatorium.web.homepage.HomePageModel@78932822
> 2015-10-01 14:44:50,850 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionActivationListener] (default task-7) Activate session: 0LbLrPIhBPXlzqXn1aqVS_-38E33YeFW-Nf-wnD3 source: org.wildfly.clustering.web.session.ImmutableHttpSessionAdapter@736c4cfd
> 2015-10-01 14:44:50,871 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionActivationListener] (default task-8) Activate session: 0LbLrPIhBPXlzqXn1aqVS_-38E33YeFW-Nf-wnD3 source: org.wildfly.clustering.web.session.ImmutableHttpSessionAdapter@3bb68e8f
> 2015-10-01 14:44:50,874 DEBUG [cz.cmhb.portal.service.security.remoting.SessionSecurityContextHolderSetterFilter] (default task-6) Attr: DebugSessionActivationListener - cz.cmhb.portal.app.informatorium.listener.DebugSessionActivationListener@629b89a4
> 2015-10-01 14:44:50,876 DEBUG [cz.cmhb.portal.service.security.remoting.SessionSecurityContextHolderSetterFilter] (default task-6) Attr: SecurityContext - cz.cmhb.portal.service.security.to.AuthenticationDetail@7d5aee75
> 2015-10-01 14:44:50,880 DEBUG [cz.cmhb.portal.service.security.remoting.SessionSecurityContextHolderSetterFilter] (default task-6) Attr: org.springframework.web.context.request.ServletRequestAttributes.DESTRUCTION_CALLBACK.scopedTarget.homePageModel - org.springframework.web.context.request.DestructionCallbackBindingListener@1250ad83
> 2015-10-01 14:44:50,881 DEBUG [cz.cmhb.portal.service.security.remoting.SessionSecurityContextHolderSetterFilter] (default task-6) Attr: MujTestovaciAttribut - JakozeMusiBytNaTeSessionPorad!!!
> 2015-10-01 14:44:50,890 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionActivationListener] (default task-8) Attr: scopedTarget.idPreviewModel cz.cmhb.portal.app.informatorium.web.preview.IdPreviewModel@a2201d4
> 2015-10-01 14:44:50,891 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionActivationListener] (default task-8) Attr: DebugSessionBindingListener cz.cmhb.portal.app.informatorium.listener.DebugSessionBindingListener@2662064a
> 2015-10-01 14:44:50,892 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionActivationListener] (default task-8) Attr: org.springframework.web.context.request.ServletRequestAttributes.DESTRUCTION_CALLBACK.scopedTarget.rights org.springframework.web.context.request.DestructionCallbackBindingListener@132f2f64
> 2015-10-01 14:44:50,893 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionActivationListener] (default task-8) Attr: scopedTarget.homePageModel cz.cmhb.portal.app.informatorium.web.homepage.HomePageModel@78932822
> 2015-10-01 14:44:50,896 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionActivationListener] (default task-8) Attr: DebugSessionActivationListener cz.cmhb.portal.app.informatorium.listener.DebugSessionActivationListener@629b89a4
> 2015-10-01 14:44:50,896 DEBUG [cz.cmhb.portal.service.security.remoting.SessionSecurityContextHolderSetterFilter] (default task-6) Attr: scopedTarget.rights - cz.cmhb.portal.app.informatorium.web.Rights@5ad5ce79
> 2015-10-01 14:44:50,897 DEBUG [cz.cmhb.portal.service.security.remoting.SessionSecurityContextHolderSetterFilter] (default task-6) Attr: org.springframework.web.context.request.ServletRequestAttributes.DESTRUCTION_CALLBACK.scopedTarget.idPreviewModel - org.springframework.web.context.request.DestructionCallbackBindingListener@6b04e322
> 2015-10-01 14:44:50,898 DEBUG [cz.cmhb.portal.service.security.remoting.SessionSecurityContextHolderSetterFilter] (default task-6) securityContext is NOT null, session id = 0LbLrPIhBPXlzqXn1aqVS_-38E33YeFW-Nf-wnD3
> 2015-10-01 14:44:50,898 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionActivationListener] (default task-7) Attr: scopedTarget.idPreviewModel cz.cmhb.portal.app.informatorium.web.preview.IdPreviewModel@a2201d4
> 2015-10-01 14:44:50,898 DEBUG [cz.cmhb.portal.service.security.remoting.SessionSecurityContextHolderSetterFilter] (default task-6) isURIOk = true
> 2015-10-01 14:44:50,899 INFO [cz.cmhb.portal.service.security.remoting.SessionSecurityContextHolderSetterFilter] (pospisilikovahana:0LbLrPIhBPXlzqXn1aqVS_-38E33YeFW-Nf-wnD3) #REQUEST #BEGIN https://portaltst.hypotecnibanka.cz/informatorium/banner
> 2015-10-01 14:44:50,899 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionActivationListener] (default task-7) Attr: DebugSessionBindingListener cz.cmhb.portal.app.informatorium.listener.DebugSessionBindingListener@2662064a
> 2015-10-01 14:44:50,900 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionActivationListener] (default task-7) Attr: org.springframework.web.context.request.ServletRequestAttributes.DESTRUCTION_CALLBACK.scopedTarget.rights org.springframework.web.context.request.DestructionCallbackBindingListener@132f2f64
> 2015-10-01 14:44:50,901 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionActivationListener] (default task-7) Attr: scopedTarget.homePageModel cz.cmhb.portal.app.informatorium.web.homepage.HomePageModel@78932822
> 2015-10-01 14:44:50,902 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionActivationListener] (default task-7) Attr: DebugSessionActivationListener cz.cmhb.portal.app.informatorium.listener.DebugSessionActivationListener@629b89a4
> 2015-10-01 14:44:50,919 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionActivationListener] (default task-7) Attr: SecurityContext cz.cmhb.portal.service.security.to.AuthenticationDetail@7d5aee75
> 2015-10-01 14:44:50,920 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionActivationListener] (default task-7) Attr: org.springframework.web.context.request.ServletRequestAttributes.DESTRUCTION_CALLBACK.scopedTarget.homePageModel org.springframework.web.context.request.DestructionCallbackBindingListener@1250ad83
> 2015-10-01 14:44:50,920 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionActivationListener] (default task-7) Attr: MujTestovaciAttribut JakozeMusiBytNaTeSessionPorad!!!
> 2015-10-01 14:44:50,921 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionActivationListener] (default task-7) Attr: scopedTarget.rights cz.cmhb.portal.app.informatorium.web.Rights@5ad5ce79
> 2015-10-01 14:44:50,922 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionActivationListener] (default task-7) Attr: org.springframework.web.context.request.ServletRequestAttributes.DESTRUCTION_CALLBACK.scopedTarget.idPreviewModel org.springframework.web.context.request.DestructionCallbackBindingListener@6b04e322
> 2015-10-01 14:44:50,922 DEBUG [cz.cmhb.portal.service.security.remoting.SessionSecurityContextHolderSetterFilter] (default task-7) Process URI /aktuality(isUriSecure=false)
> 2015-10-01 14:44:50,922 DEBUG [cz.cmhb.portal.service.security.remoting.SessionSecurityContextHolderSetterFilter] (default task-7) GET: Session id = 0LbLrPIhBPXlzqXn1aqVS_-38E33YeFW-Nf-wnD3
> 2015-10-01 14:44:50,936 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionActivationListener] (default task-8) Attr: SecurityContext cz.cmhb.portal.service.security.to.AuthenticationDetail@7d5aee75
> 2015-10-01 14:44:50,938 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionActivationListener] (default task-8) Attr: org.springframework.web.context.request.ServletRequestAttributes.DESTRUCTION_CALLBACK.scopedTarget.homePageModel org.springframework.web.context.request.DestructionCallbackBindingListener@1250ad83
> 2015-10-01 14:44:50,938 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionActivationListener] (default task-8) Attr: MujTestovaciAttribut JakozeMusiBytNaTeSessionPorad!!!
> 2015-10-01 14:44:50,939 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionActivationListener] (default task-8) Attr: scopedTarget.rights cz.cmhb.portal.app.informatorium.web.Rights@5ad5ce79
> 2015-10-01 14:44:50,940 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionActivationListener] (default task-8) Attr: org.springframework.web.context.request.ServletRequestAttributes.DESTRUCTION_CALLBACK.scopedTarget.idPreviewModel org.springframework.web.context.request.DestructionCallbackBindingListener@6b04e322
> 2015-10-01 14:44:50,940 DEBUG [cz.cmhb.portal.service.security.remoting.SessionSecurityContextHolderSetterFilter] (default task-8) Process URI /ping.html(isUriSecure=false)
> 2015-10-01 14:44:50,940 DEBUG [cz.cmhb.portal.service.security.remoting.SessionSecurityContextHolderSetterFilter] (default task-8) GET: Session id = 0LbLrPIhBPXlzqXn1aqVS_-38E33YeFW-Nf-wnD3
> 2015-10-01 14:44:50,941 DEBUG [cz.cmhb.portal.service.security.remoting.SessionSecurityContextHolderSetterFilter] (default task-8) Attr: scopedTarget.idPreviewModel - cz.cmhb.portal.app.informatorium.web.preview.IdPreviewModel@a2201d4
> 2015-10-01 14:44:50,942 DEBUG [cz.cmhb.portal.service.security.remoting.SessionSecurityContextHolderSetterFilter] (default task-7) Attr: scopedTarget.idPreviewModel - cz.cmhb.portal.app.informatorium.web.preview.IdPreviewModel@a2201d4
> 2015-10-01 14:44:50,943 DEBUG [cz.cmhb.portal.service.security.remoting.SessionSecurityContextHolderSetterFilter] (default task-8) Attr: DebugSessionBindingListener - cz.cmhb.portal.app.informatorium.listener.DebugSessionBindingListener@2662064a
> 2015-10-01 14:44:50,944 DEBUG [cz.cmhb.portal.service.security.remoting.SessionSecurityContextHolderSetterFilter] (default task-8) Attr: org.springframework.web.context.request.ServletRequestAttributes.DESTRUCTION_CALLBACK.scopedTarget.rights - org.springframework.web.context.request.DestructionCallbackBindingListener@132f2f64
> 2015-10-01 14:44:50,946 DEBUG [cz.cmhb.portal.service.security.remoting.SessionSecurityContextHolderSetterFilter] (default task-8) Attr: scopedTarget.homePageModel - cz.cmhb.portal.app.informatorium.web.homepage.HomePageModel@78932822
> 2015-10-01 14:44:50,947 DEBUG [cz.cmhb.portal.service.security.remoting.SessionSecurityContextHolderSetterFilter] (default task-8) Attr: DebugSessionActivationListener - cz.cmhb.portal.app.informatorium.listener.DebugSessionActivationListener@629b89a4
> 2015-10-01 14:44:50,949 DEBUG [cz.cmhb.portal.service.security.remoting.SessionSecurityContextHolderSetterFilter] (default task-8) Attr: SecurityContext - cz.cmhb.portal.service.security.to.AuthenticationDetail@7d5aee75
> 2015-10-01 14:44:50,953 DEBUG [cz.cmhb.portal.service.security.remoting.AuthenticationSimpleHttpInvokerRequestExecutor] (pospisilikovahana:0LbLrPIhBPXlzqXn1aqVS_-38E33YeFW-Nf-wnD3) Sending HTTP invoker request for service at [http://phspa1tst/informatorium-remote/remote/informatoriumDocumentService], with size 490
> 2015-10-01 14:44:50,954 DEBUG [cz.cmhb.portal.service.security.remoting.AuthenticationSimpleHttpInvokerRequestExecutor] (pospisilikovahana:0LbLrPIhBPXlzqXn1aqVS_-38E33YeFW-Nf-wnD3) Sending securityContext of externalContractId=1410 for session 0LbLrPIhBPXlzqXn1aqVS_-38E33YeFW-Nf-wnD3
> 2015-10-01 14:44:50,956 DEBUG [cz.cmhb.portal.service.security.remoting.SessionSecurityContextHolderSetterFilter] (default task-7) Attr: DebugSessionBindingListener - cz.cmhb.portal.app.informatorium.listener.DebugSessionBindingListener@2662064a
> 2015-10-01 14:44:50,957 DEBUG [cz.cmhb.portal.service.security.remoting.SessionSecurityContextHolderSetterFilter] (default task-7) Attr: org.springframework.web.context.request.ServletRequestAttributes.DESTRUCTION_CALLBACK.scopedTarget.rights - org.springframework.web.context.request.DestructionCallbackBindingListener@132f2f64
> 2015-10-01 14:44:50,958 DEBUG [cz.cmhb.portal.service.security.remoting.SessionSecurityContextHolderSetterFilter] (default task-7) Attr: scopedTarget.homePageModel - cz.cmhb.portal.app.informatorium.web.homepage.HomePageModel@78932822
> 2015-10-01 14:44:50,959 DEBUG [cz.cmhb.portal.service.security.remoting.SessionSecurityContextHolderSetterFilter] (default task-7) Attr: DebugSessionActivationListener - cz.cmhb.portal.app.informatorium.listener.DebugSessionActivationListener@629b89a4
> 2015-10-01 14:44:50,960 DEBUG [cz.cmhb.portal.service.security.remoting.SessionSecurityContextHolderSetterFilter] (default task-7) Attr: SecurityContext - cz.cmhb.portal.service.security.to.AuthenticationDetail@7d5aee75
> 2015-10-01 14:44:50,961 DEBUG [cz.cmhb.portal.service.security.remoting.SessionSecurityContextHolderSetterFilter] (default task-7) Attr: org.springframework.web.context.request.ServletRequestAttributes.DESTRUCTION_CALLBACK.scopedTarget.homePageModel - org.springframework.web.context.request.DestructionCallbackBindingListener@1250ad83
> 2015-10-01 14:44:50,962 DEBUG [cz.cmhb.portal.service.security.remoting.SessionSecurityContextHolderSetterFilter] (default task-7) Attr: MujTestovaciAttribut - JakozeMusiBytNaTeSessionPorad!!!
> 2015-10-01 14:44:50,963 DEBUG [cz.cmhb.portal.service.security.remoting.SessionSecurityContextHolderSetterFilter] (default task-7) Attr: scopedTarget.rights - cz.cmhb.portal.app.informatorium.web.Rights@5ad5ce79
> 2015-10-01 14:44:50,964 DEBUG [cz.cmhb.portal.service.security.remoting.SessionSecurityContextHolderSetterFilter] (default task-7) Attr: org.springframework.web.context.request.ServletRequestAttributes.DESTRUCTION_CALLBACK.scopedTarget.idPreviewModel - org.springframework.web.context.request.DestructionCallbackBindingListener@6b04e322
> 2015-10-01 14:44:50,966 DEBUG [cz.cmhb.portal.service.security.remoting.SessionSecurityContextHolderSetterFilter] (default task-7) securityContext is NOT null, session id = 0LbLrPIhBPXlzqXn1aqVS_-38E33YeFW-Nf-wnD3
> 2015-10-01 14:44:50,966 DEBUG [cz.cmhb.portal.service.security.remoting.SessionSecurityContextHolderSetterFilter] (default task-7) isURIOk = true
> 2015-10-01 14:44:50,966 INFO [cz.cmhb.portal.service.security.remoting.SessionSecurityContextHolderSetterFilter] (pospisilikovahana:0LbLrPIhBPXlzqXn1aqVS_-38E33YeFW-Nf-wnD3) #REQUEST #BEGIN https://portaltst.hypotecnibanka.cz/informatorium/aktuality
> 2015-10-01 14:44:50,969 DEBUG [cz.cmhb.portal.service.security.remoting.SessionSecurityContextHolderSetterFilter] (default task-8) Attr: org.springframework.web.context.request.ServletRequestAttributes.DESTRUCTION_CALLBACK.scopedTarget.homePageModel - org.springframework.web.context.request.DestructionCallbackBindingListener@1250ad83
> 2015-10-01 14:44:50,969 DEBUG [cz.cmhb.portal.service.security.remoting.SessionSecurityContextHolderSetterFilter] (default task-8) Attr: MujTestovaciAttribut - JakozeMusiBytNaTeSessionPorad!!!
> 2015-10-01 14:44:50,970 DEBUG [cz.cmhb.portal.service.security.remoting.SessionSecurityContextHolderSetterFilter] (default task-8) Attr: scopedTarget.rights - cz.cmhb.portal.app.informatorium.web.Rights@5ad5ce79
> 2015-10-01 14:44:50,971 DEBUG [cz.cmhb.portal.service.security.remoting.SessionSecurityContextHolderSetterFilter] (default task-8) Attr: org.springframework.web.context.request.ServletRequestAttributes.DESTRUCTION_CALLBACK.scopedTarget.idPreviewModel - org.springframework.web.context.request.DestructionCallbackBindingListener@6b04e322
> 2015-10-01 14:44:50,972 DEBUG [cz.cmhb.portal.service.security.remoting.SessionSecurityContextHolderSetterFilter] (default task-8) securityContext is NOT null, session id = 0LbLrPIhBPXlzqXn1aqVS_-38E33YeFW-Nf-wnD3
> 2015-10-01 14:44:50,973 DEBUG [cz.cmhb.portal.service.security.remoting.SessionSecurityContextHolderSetterFilter] (default task-8) isURIOk = true
> 2015-10-01 14:44:50,973 INFO [cz.cmhb.portal.service.security.remoting.SessionSecurityContextHolderSetterFilter] (pospisilikovahana:0LbLrPIhBPXlzqXn1aqVS_-38E33YeFW-Nf-wnD3) #REQUEST #BEGIN https://portaltst.hypotecnibanka.cz/informatorium/ping.html
> 2015-10-01 14:44:50,996 INFO [cz.cmhb.portal.service.security.remoting.SessionSecurityContextHolderSetterFilter] (pospisilikovahana:0LbLrPIhBPXlzqXn1aqVS_-38E33YeFW-Nf-wnD3) #REQUEST #END:56 https://portaltst.hypotecnibanka.cz/informatorium/ping.html
> 2015-10-01 14:44:51,013 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionActivationListener] (default task-8) Passivate session: 0LbLrPIhBPXlzqXn1aqVS_-38E33YeFW-Nf-wnD3 source: org.wildfly.clustering.web.session.ImmutableHttpSessionAdapter@6f270cb6
> 2015-10-01 14:44:51,014 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionActivationListener] (default task-8) Attr: scopedTarget.idPreviewModel cz.cmhb.portal.app.informatorium.web.preview.IdPreviewModel@a2201d4
> 2015-10-01 14:44:51,015 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionActivationListener] (default task-8) Attr: DebugSessionBindingListener cz.cmhb.portal.app.informatorium.listener.DebugSessionBindingListener@2662064a
> 2015-10-01 14:44:51,017 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionActivationListener] (default task-8) Attr: org.springframework.web.context.request.ServletRequestAttributes.DESTRUCTION_CALLBACK.scopedTarget.rights org.springframework.web.context.request.DestructionCallbackBindingListener@132f2f64
> 2015-10-01 14:44:51,018 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionActivationListener] (default task-8) Attr: scopedTarget.homePageModel cz.cmhb.portal.app.informatorium.web.homepage.HomePageModel@78932822
> 2015-10-01 14:44:51,027 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionActivationListener] (default task-8) Attr: DebugSessionActivationListener cz.cmhb.portal.app.informatorium.listener.DebugSessionActivationListener@629b89a4
> 2015-10-01 14:44:51,029 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionActivationListener] (default task-8) Attr: SecurityContext cz.cmhb.portal.service.security.to.AuthenticationDetail@7d5aee75
> 2015-10-01 14:44:51,030 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionActivationListener] (default task-8) Attr: org.springframework.web.context.request.ServletRequestAttributes.DESTRUCTION_CALLBACK.scopedTarget.homePageModel org.springframework.web.context.request.DestructionCallbackBindingListener@1250ad83
> 2015-10-01 14:44:51,030 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionActivationListener] (default task-8) Attr: MujTestovaciAttribut JakozeMusiBytNaTeSessionPorad!!!
> 2015-10-01 14:44:51,031 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionActivationListener] (default task-8) Attr: scopedTarget.rights cz.cmhb.portal.app.informatorium.web.Rights@5ad5ce79
> 2015-10-01 14:44:51,032 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionActivationListener] (default task-8) Attr: org.springframework.web.context.request.ServletRequestAttributes.DESTRUCTION_CALLBACK.scopedTarget.idPreviewModel org.springframework.web.context.request.DestructionCallbackBindingListener@6b04e322
> 2015-10-01 14:44:51,042 TRACE [org.wildfly.clustering.web.infinispan] (default task-8) Session 0LbLrPIhBPXlzqXn1aqVS_-38E33YeFW-Nf-wnD3 will expire in 120000 ms
> 2015-10-01 14:44:51,056 DEBUG [cz.cmhb.portal.service.security.remoting.AuthenticationSimpleHttpInvokerRequestExecutor] (pospisilikovahana:0LbLrPIhBPXlzqXn1aqVS_-38E33YeFW-Nf-wnD3) Sending HTTP invoker request for service at [http://phspa1tst/informatorium-remote/remote/informatoriumDocumentService], with size 490
> 2015-10-01 14:44:51,057 DEBUG [cz.cmhb.portal.service.security.remoting.AuthenticationSimpleHttpInvokerRequestExecutor] (pospisilikovahana:0LbLrPIhBPXlzqXn1aqVS_-38E33YeFW-Nf-wnD3) Sending securityContext of externalContractId=1410 for session 0LbLrPIhBPXlzqXn1aqVS_-38E33YeFW-Nf-wnD3
> 2015-10-01 14:44:51,215 INFO [cz.cmhb.portal.service.security.remoting.SessionSecurityContextHolderSetterFilter] (pospisilikovahana:0LbLrPIhBPXlzqXn1aqVS_-38E33YeFW-Nf-wnD3) #REQUEST #END:387 https://portaltst.hypotecnibanka.cz/informatorium/banner
> 2015-10-01 14:44:51,244 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionActivationListener] (default task-6) Passivate session: 0LbLrPIhBPXlzqXn1aqVS_-38E33YeFW-Nf-wnD3 source: org.wildfly.clustering.web.session.ImmutableHttpSessionAdapter@66a855cc
> 2015-10-01 14:44:51,245 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionActivationListener] (default task-6) Attr: scopedTarget.idPreviewModel cz.cmhb.portal.app.informatorium.web.preview.IdPreviewModel@a2201d4
> 2015-10-01 14:44:51,246 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionActivationListener] (default task-6) Attr: DebugSessionBindingListener cz.cmhb.portal.app.informatorium.listener.DebugSessionBindingListener@2662064a
> 2015-10-01 14:44:51,247 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionActivationListener] (default task-6) Attr: org.springframework.web.context.request.ServletRequestAttributes.DESTRUCTION_CALLBACK.scopedTarget.rights org.springframework.web.context.request.DestructionCallbackBindingListener@132f2f64
> 2015-10-01 14:44:51,248 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionActivationListener] (default task-6) Attr: scopedTarget.homePageModel cz.cmhb.portal.app.informatorium.web.homepage.HomePageModel@78932822
> 2015-10-01 14:44:51,249 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionActivationListener] (default task-6) Attr: DebugSessionActivationListener cz.cmhb.portal.app.informatorium.listener.DebugSessionActivationListener@629b89a4
> 2015-10-01 14:44:51,250 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionActivationListener] (default task-6) Attr: SecurityContext cz.cmhb.portal.service.security.to.AuthenticationDetail@7d5aee75
> 2015-10-01 14:44:51,259 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionActivationListener] (default task-6) Attr: org.springframework.web.context.request.ServletRequestAttributes.DESTRUCTION_CALLBACK.scopedTarget.homePageModel org.springframework.web.context.request.DestructionCallbackBindingListener@1250ad83
> 2015-10-01 14:44:51,259 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionActivationListener] (default task-6) Attr: MujTestovaciAttribut JakozeMusiBytNaTeSessionPorad!!!
> 2015-10-01 14:44:51,260 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionActivationListener] (default task-6) Attr: scopedTarget.rights cz.cmhb.portal.app.informatorium.web.Rights@5ad5ce79
> 2015-10-01 14:44:51,278 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionActivationListener] (default task-6) Attr: org.springframework.web.context.request.ServletRequestAttributes.DESTRUCTION_CALLBACK.scopedTarget.idPreviewModel org.springframework.web.context.request.DestructionCallbackBindingListener@6b04e322
> 2015-10-01 14:44:51,279 TRACE [org.wildfly.clustering.web.infinispan] (default task-6) Session 0LbLrPIhBPXlzqXn1aqVS_-38E33YeFW-Nf-wnD3 will expire in 120000 ms
> 2015-10-01 14:44:51,405 INFO [cz.cmhb.portal.service.security.remoting.SessionSecurityContextHolderSetterFilter] (pospisilikovahana:0LbLrPIhBPXlzqXn1aqVS_-38E33YeFW-Nf-wnD3) #REQUEST #END:483 https://portaltst.hypotecnibanka.cz/informatorium/aktuality
> 2015-10-01 14:44:51,438 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionActivationListener] (default task-7) Passivate session: 0LbLrPIhBPXlzqXn1aqVS_-38E33YeFW-Nf-wnD3 source: org.wildfly.clustering.web.session.ImmutableHttpSessionAdapter@47a970b2
> 2015-10-01 14:44:51,440 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionActivationListener] (default task-7) Attr: scopedTarget.idPreviewModel cz.cmhb.portal.app.informatorium.web.preview.IdPreviewModel@a2201d4
> 2015-10-01 14:44:51,441 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionActivationListener] (default task-7) Attr: DebugSessionBindingListener cz.cmhb.portal.app.informatorium.listener.DebugSessionBindingListener@2662064a
> 2015-10-01 14:44:51,442 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionActivationListener] (default task-7) Attr: org.springframework.web.context.request.ServletRequestAttributes.DESTRUCTION_CALLBACK.scopedTarget.rights org.springframework.web.context.request.DestructionCallbackBindingListener@132f2f64
> 2015-10-01 14:44:51,443 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionActivationListener] (default task-7) Attr: scopedTarget.homePageModel cz.cmhb.portal.app.informatorium.web.homepage.HomePageModel@78932822
> 2015-10-01 14:44:51,444 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionActivationListener] (default task-7) Attr: DebugSessionActivationListener cz.cmhb.portal.app.informatorium.listener.DebugSessionActivationListener@629b89a4
> 2015-10-01 14:44:51,445 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionActivationListener] (default task-7) Attr: SecurityContext cz.cmhb.portal.service.security.to.AuthenticationDetail@7d5aee75
> 2015-10-01 14:44:51,454 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionActivationListener] (default task-7) Attr: org.springframework.web.context.request.ServletRequestAttributes.DESTRUCTION_CALLBACK.scopedTarget.homePageModel org.springframework.web.context.request.DestructionCallbackBindingListener@1250ad83
> 2015-10-01 14:44:51,455 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionActivationListener] (default task-7) Attr: MujTestovaciAttribut JakozeMusiBytNaTeSessionPorad!!!
> 2015-10-01 14:44:51,456 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionActivationListener] (default task-7) Attr: scopedTarget.rights cz.cmhb.portal.app.informatorium.web.Rights@5ad5ce79
> 2015-10-01 14:44:51,457 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionActivationListener] (default task-7) Attr: org.springframework.web.context.request.ServletRequestAttributes.DESTRUCTION_CALLBACK.scopedTarget.idPreviewModel org.springframework.web.context.request.DestructionCallbackBindingListener@6b04e322
> 2015-10-01 14:44:51,458 TRACE [org.wildfly.clustering.web.infinispan] (default task-7) Session 0LbLrPIhBPXlzqXn1aqVS_-38E33YeFW-Nf-wnD3 will expire in 120000 ms
> 2015-10-01 14:44:52,429 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionActivationListener] (default task-9) Activate session: 0LbLrPIhBPXlzqXn1aqVS_-38E33YeFW-Nf-wnD3 source: org.wildfly.clustering.web.session.ImmutableHttpSessionAdapter@4cbaac8c
> 2015-10-01 14:44:52,440 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionActivationListener] (default task-9) Attr: scopedTarget.idPreviewModel cz.cmhb.portal.app.informatorium.web.preview.IdPreviewModel@a2201d4
> 2015-10-01 14:44:52,444 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionActivationListener] (default task-9) Attr: DebugSessionBindingListener cz.cmhb.portal.app.informatorium.listener.DebugSessionBindingListener@2662064a
> 2015-10-01 14:44:52,450 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionActivationListener] (default task-9) Attr: org.springframework.web.context.request.ServletRequestAttributes.DESTRUCTION_CALLBACK.scopedTarget.rights org.springframework.web.context.request.DestructionCallbackBindingListener@132f2f64
> 2015-10-01 14:44:52,453 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionActivationListener] (default task-9) Attr: scopedTarget.homePageModel cz.cmhb.portal.app.informatorium.web.homepage.HomePageModel@78932822
> 2015-10-01 14:44:52,459 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionActivationListener] (default task-9) Attr: DebugSessionActivationListener cz.cmhb.portal.app.informatorium.listener.DebugSessionActivationListener@629b89a4
> 2015-10-01 14:44:52,467 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionActivationListener] (default task-9) Attr: SecurityContext cz.cmhb.portal.service.security.to.AuthenticationDetail@7d5aee75
> 2015-10-01 14:44:52,478 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionActivationListener] (default task-9) Attr: org.springframework.web.context.request.ServletRequestAttributes.DESTRUCTION_CALLBACK.scopedTarget.homePageModel org.springframework.web.context.request.DestructionCallbackBindingListener@1250ad83
> 2015-10-01 14:44:52,479 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionActivationListener] (default task-9) Attr: MujTestovaciAttribut JakozeMusiBytNaTeSessionPorad!!!
> 2015-10-01 14:44:52,482 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionActivationListener] (default task-9) Attr: scopedTarget.rights cz.cmhb.portal.app.informatorium.web.Rights@5ad5ce79
> 2015-10-01 14:44:52,485 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionActivationListener] (default task-9) Attr: org.springframework.web.context.request.ServletRequestAttributes.DESTRUCTION_CALLBACK.scopedTarget.idPreviewModel org.springframework.web.context.request.DestructionCallbackBindingListener@6b04e322
> 2015-10-01 14:44:52,497 DEBUG [cz.cmhb.portal.service.security.remoting.SessionSecurityContextHolderSetterFilter] (default task-9) Process URI /doLogout(isUriSecure=true)
> 2015-10-01 14:44:52,497 DEBUG [cz.cmhb.portal.service.security.remoting.SessionSecurityContextHolderSetterFilter] (default task-9) GET: Session id = 0LbLrPIhBPXlzqXn1aqVS_-38E33YeFW-Nf-wnD3
> 2015-10-01 14:44:52,505 DEBUG [cz.cmhb.portal.service.security.remoting.SessionSecurityContextHolderSetterFilter] (default task-9) Attr: scopedTarget.idPreviewModel - cz.cmhb.portal.app.informatorium.web.preview.IdPreviewModel@a2201d4
> 2015-10-01 14:44:52,508 DEBUG [cz.cmhb.portal.service.security.remoting.SessionSecurityContextHolderSetterFilter] (default task-9) Attr: DebugSessionBindingListener - cz.cmhb.portal.app.informatorium.listener.DebugSessionBindingListener@2662064a
> 2015-10-01 14:44:52,511 DEBUG [cz.cmhb.portal.service.security.remoting.SessionSecurityContextHolderSetterFilter] (default task-9) Attr: org.springframework.web.context.request.ServletRequestAttributes.DESTRUCTION_CALLBACK.scopedTarget.rights - org.springframework.web.context.request.DestructionCallbackBindingListener@132f2f64
> 2015-10-01 14:44:52,514 DEBUG [cz.cmhb.portal.service.security.remoting.SessionSecurityContextHolderSetterFilter] (default task-9) Attr: scopedTarget.homePageModel - cz.cmhb.portal.app.informatorium.web.homepage.HomePageModel@78932822
> 2015-10-01 14:44:52,518 DEBUG [cz.cmhb.portal.service.security.remoting.SessionSecurityContextHolderSetterFilter] (default task-9) Attr: DebugSessionActivationListener - cz.cmhb.portal.app.informatorium.listener.DebugSessionActivationListener@629b89a4
> 2015-10-01 14:44:52,521 DEBUG [cz.cmhb.portal.service.security.remoting.SessionSecurityContextHolderSetterFilter] (default task-9) Attr: SecurityContext - cz.cmhb.portal.service.security.to.AuthenticationDetail@7d5aee75
> 2015-10-01 14:44:52,524 DEBUG [cz.cmhb.portal.service.security.remoting.SessionSecurityContextHolderSetterFilter] (default task-9) Attr: org.springframework.web.context.request.ServletRequestAttributes.DESTRUCTION_CALLBACK.scopedTarget.homePageModel - org.springframework.web.context.request.DestructionCallbackBindingListener@1250ad83
> 2015-10-01 14:44:52,525 DEBUG [cz.cmhb.portal.service.security.remoting.SessionSecurityContextHolderSetterFilter] (default task-9) Attr: MujTestovaciAttribut - JakozeMusiBytNaTeSessionPorad!!!
> 2015-10-01 14:44:52,529 DEBUG [cz.cmhb.portal.service.security.remoting.SessionSecurityContextHolderSetterFilter] (default task-9) Attr: scopedTarget.rights - cz.cmhb.portal.app.informatorium.web.Rights@5ad5ce79
> 2015-10-01 14:44:52,541 DEBUG [cz.cmhb.portal.service.security.remoting.SessionSecurityContextHolderSetterFilter] (default task-9) Attr: org.springframework.web.context.request.ServletRequestAttributes.DESTRUCTION_CALLBACK.scopedTarget.idPreviewModel - org.springframework.web.context.request.DestructionCallbackBindingListener@6b04e322
> 2015-10-01 14:44:52,544 DEBUG [cz.cmhb.portal.service.security.remoting.SessionSecurityContextHolderSetterFilter] (default task-9) securityContext is NOT null, session id = 0LbLrPIhBPXlzqXn1aqVS_-38E33YeFW-Nf-wnD3
> 2015-10-01 14:44:52,544 DEBUG [cz.cmhb.portal.service.security.remoting.SessionSecurityContextHolderSetterFilter] (default task-9) isURIOk = true
> 2015-10-01 14:44:52,545 INFO [cz.cmhb.portal.service.security.remoting.SessionSecurityContextHolderSetterFilter] (pospisilikovahana:0LbLrPIhBPXlzqXn1aqVS_-38E33YeFW-Nf-wnD3) #REQUEST #BEGIN https://portaltst.hypotecnibanka.cz/informatorium/doLogout
> 2015-10-01 14:44:52,629 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionAttributteListener] (pospisilikovahana:0LbLrPIhBPXlzqXn1aqVS_-38E33YeFW-Nf-wnD3) Attribute removed : SecurityContext : cz.cmhb.portal.service.security.to.AuthenticationDetail@7d5aee75 session: 0LbLrPIhBPXlzqXn1aqVS_-38E33YeFW-Nf-wnD3 source: io.undertow.servlet.spec.HttpSessionImpl@2bd40b1f
> 2015-10-01 14:44:52,630 DEBUG [cz.cmhb.portal.service.security.remoting.AuthenticationSimpleHttpInvokerRequestExecutor] (pospisilikovahana:0LbLrPIhBPXlzqXn1aqVS_-38E33YeFW-Nf-wnD3) Sending HTTP invoker request for service at [http://phspa1tst/informatorium-remote/remote/informatoriumAuthenticationS...], with size 300
> 2015-10-01 14:44:52,640 DEBUG [cz.cmhb.portal.service.security.remoting.AuthenticationSimpleHttpInvokerRequestExecutor] (pospisilikovahana:0LbLrPIhBPXlzqXn1aqVS_-38E33YeFW-Nf-wnD3) Sending securityContext of externalContractId=1410 for session 0LbLrPIhBPXlzqXn1aqVS_-38E33YeFW-Nf-wnD3
> 2015-10-01 14:44:52,715 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionActivationListener] (pospisilikovahana:0LbLrPIhBPXlzqXn1aqVS_-38E33YeFW-Nf-wnD3) Passivate session: 0LbLrPIhBPXlzqXn1aqVS_-38E33YeFW-Nf-wnD3 source: org.wildfly.clustering.web.session.ImmutableHttpSessionAdapter@2ccc6a4c
> 2015-10-01 14:44:52,717 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionActivationListener] (pospisilikovahana:0LbLrPIhBPXlzqXn1aqVS_-38E33YeFW-Nf-wnD3) Attr: scopedTarget.idPreviewModel cz.cmhb.portal.app.informatorium.web.preview.IdPreviewModel@a2201d4
> 2015-10-01 14:44:52,718 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionActivationListener] (pospisilikovahana:0LbLrPIhBPXlzqXn1aqVS_-38E33YeFW-Nf-wnD3) Attr: DebugSessionBindingListener cz.cmhb.portal.app.informatorium.listener.DebugSessionBindingListener@2662064a
> 2015-10-01 14:44:52,720 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionActivationListener] (pospisilikovahana:0LbLrPIhBPXlzqXn1aqVS_-38E33YeFW-Nf-wnD3) Attr: org.springframework.web.context.request.ServletRequestAttributes.DESTRUCTION_CALLBACK.scopedTarget.rights org.springframework.web.context.request.DestructionCallbackBindingListener@132f2f64
> 2015-10-01 14:44:52,721 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionActivationListener] (pospisilikovahana:0LbLrPIhBPXlzqXn1aqVS_-38E33YeFW-Nf-wnD3) Attr: scopedTarget.homePageModel cz.cmhb.portal.app.informatorium.web.homepage.HomePageModel@78932822
> 2015-10-01 14:44:52,722 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionActivationListener] (pospisilikovahana:0LbLrPIhBPXlzqXn1aqVS_-38E33YeFW-Nf-wnD3) Attr: DebugSessionActivationListener cz.cmhb.portal.app.informatorium.listener.DebugSessionActivationListener@629b89a4
> 2015-10-01 14:44:52,723 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionActivationListener] (pospisilikovahana:0LbLrPIhBPXlzqXn1aqVS_-38E33YeFW-Nf-wnD3) Attr: org.springframework.web.context.request.ServletRequestAttributes.DESTRUCTION_CALLBACK.scopedTarget.homePageModel org.springframework.web.context.request.DestructionCallbackBindingListener@1250ad83
> 2015-10-01 14:44:52,723 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionActivationListener] (pospisilikovahana:0LbLrPIhBPXlzqXn1aqVS_-38E33YeFW-Nf-wnD3) Attr: MujTestovaciAttribut JakozeMusiBytNaTeSessionPorad!!!
> 2015-10-01 14:44:52,726 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionActivationListener] (pospisilikovahana:0LbLrPIhBPXlzqXn1aqVS_-38E33YeFW-Nf-wnD3) Attr: scopedTarget.rights cz.cmhb.portal.app.informatorium.web.Rights@5ad5ce79
> 2015-10-01 14:44:52,732 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionActivationListener] (pospisilikovahana:0LbLrPIhBPXlzqXn1aqVS_-38E33YeFW-Nf-wnD3) Attr: org.springframework.web.context.request.ServletRequestAttributes.DESTRUCTION_CALLBACK.scopedTarget.idPreviewModel org.springframework.web.context.request.DestructionCallbackBindingListener@6b04e322
> 2015-10-01 14:44:52,732 TRACE [org.wildfly.clustering.web.infinispan] (pospisilikovahana:0LbLrPIhBPXlzqXn1aqVS_-38E33YeFW-Nf-wnD3) Session 0LbLrPIhBPXlzqXn1aqVS_-38E33YeFW-Nf-wnD3 will expire in 120000 ms
> 2015-10-01 14:44:52,734 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionAttributteListener] (pospisilikovahana:0LbLrPIhBPXlzqXn1aqVS_-38E33YeFW-Nf-wnD3) Attribute added : __MessageStoreInterceptor_ActionErrors_SessionKey : [] session: 0LbLrPIhBPXlzqXn1aqVS_-38E33YeFW-Nf-wnD3 source: io.undertow.servlet.spec.HttpSessionImpl@2bd40b1f
> 2015-10-01 14:44:52,735 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionAttributteListener] (pospisilikovahana:0LbLrPIhBPXlzqXn1aqVS_-38E33YeFW-Nf-wnD3) Attribute added : __MessageStoreInterceptor_ActionMessages_SessionKey : [] session: 0LbLrPIhBPXlzqXn1aqVS_-38E33YeFW-Nf-wnD3 source: io.undertow.servlet.spec.HttpSessionImpl@2bd40b1f
> 2015-10-01 14:44:52,736 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionAttributteListener] (pospisilikovahana:0LbLrPIhBPXlzqXn1aqVS_-38E33YeFW-Nf-wnD3) Attribute added : __MessageStoreInterceptor_FieldErrors_SessionKey : {} session: 0LbLrPIhBPXlzqXn1aqVS_-38E33YeFW-Nf-wnD3 source: io.undertow.servlet.spec.HttpSessionImpl@2bd40b1f
> 2015-10-01 14:44:52,742 INFO [cz.cmhb.portal.service.security.remoting.SessionSecurityContextHolderSetterFilter] (pospisilikovahana:0LbLrPIhBPXlzqXn1aqVS_-38E33YeFW-Nf-wnD3) #REQUEST #END:245 https://portaltst.hypotecnibanka.cz/informatorium/doLogout
> 2015-10-01 14:44:52,743 DEBUG [cz.cmhb.portal.app.informatorium.filter.InformatoriumDoLogoutFilter] (default task-9) Logout action and valid session -> invalidate session.
> 2015-10-01 14:44:52,744 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionAttributteListener] (default task-9) Attribute removed : __MessageStoreInterceptor_ActionErrors_SessionKey : [] session: 0LbLrPIhBPXlzqXn1aqVS_-38E33YeFW-Nf-wnD3 source: io.undertow.servlet.spec.HttpSessionImpl@2bd40b1f
> 2015-10-01 14:44:52,745 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionAttributteListener] (default task-9) Attribute removed : org.springframework.web.context.request.ServletRequestAttributes.DESTRUCTION_CALLBACK.scopedTarget.rights : org.springframework.web.context.request.DestructionCallbackBindingListener@132f2f64 session: 0LbLrPIhBPXlzqXn1aqVS_-38E33YeFW-Nf-wnD3 source: io.undertow.servlet.spec.HttpSessionImpl@2bd40b1f
> 2015-10-01 14:44:52,745 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionAttributteListener] (default task-9) Attribute removed : __MessageStoreInterceptor_ActionMessages_SessionKey : [] session: 0LbLrPIhBPXlzqXn1aqVS_-38E33YeFW-Nf-wnD3 source: io.undertow.servlet.spec.HttpSessionImpl@2bd40b1f
> 2015-10-01 14:44:52,746 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionAttributteListener] (default task-9) Attribute removed : scopedTarget.idPreviewModel : cz.cmhb.portal.app.informatorium.web.preview.IdPreviewModel@a2201d4 session: 0LbLrPIhBPXlzqXn1aqVS_-38E33YeFW-Nf-wnD3 source: io.undertow.servlet.spec.HttpSessionImpl@2bd40b1f
> 2015-10-01 14:44:52,747 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionAttributteListener] (default task-9) Attribute removed : __MessageStoreInterceptor_FieldErrors_SessionKey : {} session: 0LbLrPIhBPXlzqXn1aqVS_-38E33YeFW-Nf-wnD3 source: io.undertow.servlet.spec.HttpSessionImpl@2bd40b1f
> 2015-10-01 14:44:52,748 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionAttributteListener] (default task-9) Attribute removed : DebugSessionBindingListener : cz.cmhb.portal.app.informatorium.listener.DebugSessionBindingListener@2662064a session: 0LbLrPIhBPXlzqXn1aqVS_-38E33YeFW-Nf-wnD3 source: io.undertow.servlet.spec.HttpSessionImpl@2bd40b1f
> 2015-10-01 14:44:52,751 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionBindingListener] (default task-9) Value unbound : DebugSessionBindingListener : cz.cmhb.portal.app.informatorium.listener.DebugSessionBindingListener@2662064a session: 0LbLrPIhBPXlzqXn1aqVS_-38E33YeFW-Nf-wnD3 source: io.undertow.servlet.spec.HttpSessionImpl@2bd40b1f
> 2015-10-01 14:44:52,752 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionAttributteListener] (default task-9) Attribute removed : scopedTarget.homePageModel : cz.cmhb.portal.app.informatorium.web.homepage.HomePageModel@78932822 session: 0LbLrPIhBPXlzqXn1aqVS_-38E33YeFW-Nf-wnD3 source: io.undertow.servlet.spec.HttpSessionImpl@2bd40b1f
> 2015-10-01 14:44:52,753 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionAttributteListener] (default task-9) Attribute removed : DebugSessionActivationListener : cz.cmhb.portal.app.informatorium.listener.DebugSessionActivationListener@629b89a4 session: 0LbLrPIhBPXlzqXn1aqVS_-38E33YeFW-Nf-wnD3 source: io.undertow.servlet.spec.HttpSessionImpl@2bd40b1f
> 2015-10-01 14:44:52,754 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionAttributteListener] (default task-9) Attribute removed : org.springframework.web.context.request.ServletRequestAttributes.DESTRUCTION_CALLBACK.scopedTarget.homePageModel : org.springframework.web.context.request.DestructionCallbackBindingListener@1250ad83 session: 0LbLrPIhBPXlzqXn1aqVS_-38E33YeFW-Nf-wnD3 source: io.undertow.servlet.spec.HttpSessionImpl@2bd40b1f
> 2015-10-01 14:44:52,757 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionAttributteListener] (default task-9) Attribute removed : MujTestovaciAttribut : JakozeMusiBytNaTeSessionPorad!!! session: 0LbLrPIhBPXlzqXn1aqVS_-38E33YeFW-Nf-wnD3 source: io.undertow.servlet.spec.HttpSessionImpl@2bd40b1f
> 2015-10-01 14:44:52,759 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionAttributteListener] (default task-9) Attribute removed : scopedTarget.rights : cz.cmhb.portal.app.informatorium.web.Rights@5ad5ce79 session: 0LbLrPIhBPXlzqXn1aqVS_-38E33YeFW-Nf-wnD3 source: io.undertow.servlet.spec.HttpSessionImpl@2bd40b1f
> 2015-10-01 14:44:52,759 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionAttributteListener] (default task-9) Attribute removed : org.springframework.web.context.request.ServletRequestAttributes.DESTRUCTION_CALLBACK.scopedTarget.idPreviewModel : org.springframework.web.context.request.DestructionCallbackBindingListener@6b04e322 session: 0LbLrPIhBPXlzqXn1aqVS_-38E33YeFW-Nf-wnD3 source: io.undertow.servlet.spec.HttpSessionImpl@2bd40b1f
> 2015-10-01 14:44:52,760 TRACE [org.wildfly.clustering.web.infinispan] (default task-9) Session 0LbLrPIhBPXlzqXn1aqVS_-38E33YeFW-Nf-wnD3 will be removed
> 2015-10-01 14:44:52,811 TRACE [org.wildfly.clustering.web.infinispan] (default task-10) Session 0LbLrPIhBPXlzqXn1aqVS_-38E33YeFW-Nf-wnD3 not found
> 2015-10-01 14:44:52,812 TRACE [org.wildfly.clustering.web.infinispan] (default task-10) Session 0LbLrPIhBPXlzqXn1aqVS_-38E33YeFW-Nf-wnD3 not found
> {noformat}
> NOT Working
> {noformat}
> 2015-10-01 14:44:57,506 DEBUG [cz.cmhb.portal.app.informatorium.web.login.actions.DoLoginAction] (default task-11) Login action -> create new session: UcZtmad7hG2alDsqlrb2OykXULT4AJBv7UAzmWz_
> 2015-10-01 14:44:57,508 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionAttributteListener] (default task-11) Attribute added : SecurityContext : cz.cmhb.portal.service.security.to.AuthenticationDetail@42854171 session: UcZtmad7hG2alDsqlrb2OykXULT4AJBv7UAzmWz_ source: io.undertow.servlet.spec.HttpSessionImpl@348126fd
> 2015-10-01 14:44:57,509 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionAttributteListener] (default task-11) Attribute added : MujTestovaciAttribut : JakozeMusiBytNaTeSessionPorad!!! session: UcZtmad7hG2alDsqlrb2OykXULT4AJBv7UAzmWz_ source: io.undertow.servlet.spec.HttpSessionImpl@348126fd
> 2015-10-01 14:44:57,510 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionAttributteListener] (default task-11) Attribute added : DebugSessionBindingListener : cz.cmhb.portal.app.informatorium.listener.DebugSessionBindingListener@30106cdc session: UcZtmad7hG2alDsqlrb2OykXULT4AJBv7UAzmWz_ source: io.undertow.servlet.spec.HttpSessionImpl@348126fd
> 2015-10-01 14:44:57,511 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionBindingListener] (default task-11) Value bound : DebugSessionBindingListener : cz.cmhb.portal.app.informatorium.listener.DebugSessionBindingListener@30106cdc session: UcZtmad7hG2alDsqlrb2OykXULT4AJBv7UAzmWz_ source: io.undertow.servlet.spec.HttpSessionImpl@348126fd
> 2015-10-01 14:44:57,511 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionAttributteListener] (default task-11) Attribute added : DebugSessionActivationListener : cz.cmhb.portal.app.informatorium.listener.DebugSessionActivationListener@55c05af0 session: UcZtmad7hG2alDsqlrb2OykXULT4AJBv7UAzmWz_ source: io.undertow.servlet.spec.HttpSessionImpl@348126fd
> 2015-10-01 14:44:57,511 DEBUG [cz.cmhb.portal.app.informatorium.web.login.actions.DoLoginAction] (default task-11) PUT: Session id = UcZtmad7hG2alDsqlrb2OykXULT4AJBv7UAzmWz_
> 2015-10-01 14:44:57,512 DEBUG [cz.cmhb.portal.app.informatorium.web.login.actions.DoLoginAction] (default task-11) Attr: DebugSessionBindingListener cz.cmhb.portal.app.informatorium.listener.DebugSessionBindingListener@30106cdc
> 2015-10-01 14:44:57,512 DEBUG [cz.cmhb.portal.app.informatorium.web.login.actions.DoLoginAction] (default task-11) Attr: DebugSessionActivationListener cz.cmhb.portal.app.informatorium.listener.DebugSessionActivationListener@55c05af0
> 2015-10-01 14:44:57,512 DEBUG [cz.cmhb.portal.app.informatorium.web.login.actions.DoLoginAction] (default task-11) Attr: SecurityContext cz.cmhb.portal.service.security.to.AuthenticationDetail@42854171
> 2015-10-01 14:44:57,513 DEBUG [cz.cmhb.portal.app.informatorium.web.login.actions.DoLoginAction] (default task-11) Attr: MujTestovaciAttribut JakozeMusiBytNaTeSessionPorad!!!
> 2015-10-01 14:44:57,517 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionActivationListener] (default task-11) Passivate session: UcZtmad7hG2alDsqlrb2OykXULT4AJBv7UAzmWz_ source: org.wildfly.clustering.web.session.ImmutableHttpSessionAdapter@3da617f0
> 2015-10-01 14:44:57,517 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionActivationListener] (default task-11) Attr: DebugSessionBindingListener cz.cmhb.portal.app.informatorium.listener.DebugSessionBindingListener@30106cdc
> 2015-10-01 14:44:57,518 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionActivationListener] (default task-11) Attr: DebugSessionActivationListener cz.cmhb.portal.app.informatorium.listener.DebugSessionActivationListener@55c05af0
> 2015-10-01 14:44:57,518 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionActivationListener] (default task-11) Attr: SecurityContext cz.cmhb.portal.service.security.to.AuthenticationDetail@42854171
> 2015-10-01 14:44:57,518 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionActivationListener] (default task-11) Attr: MujTestovaciAttribut JakozeMusiBytNaTeSessionPorad!!!
> 2015-10-01 14:44:57,519 TRACE [org.wildfly.clustering.web.infinispan] (default task-11) Session UcZtmad7hG2alDsqlrb2OykXULT4AJBv7UAzmWz_ will expire in 120000 ms
> 2015-10-01 14:44:57,527 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionAttributteListener] (default task-11) Attribute added : __MessageStoreInterceptor_ActionErrors_SessionKey : [] session: UcZtmad7hG2alDsqlrb2OykXULT4AJBv7UAzmWz_ source: io.undertow.servlet.spec.HttpSessionImpl@348126fd
> 2015-10-01 14:44:57,527 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionAttributteListener] (default task-11) Attribute added : __MessageStoreInterceptor_ActionMessages_SessionKey : [] session: UcZtmad7hG2alDsqlrb2OykXULT4AJBv7UAzmWz_ source: io.undertow.servlet.spec.HttpSessionImpl@348126fd
> 2015-10-01 14:44:57,528 DEBUG [cz.cmhb.portal.app.informatorium.listener.DebugSessionAttributteListener] (default task-11) Attribute added : __MessageStoreInterceptor_FieldErrors_SessionKey : {} session: UcZtmad7hG2alDsqlrb2OykXULT4AJBv7UAzmWz_ source: io.undertow.servlet.spec.HttpSessionImpl@348126fd
> 2015-10-01 14:44:57,736 DEBUG [cz.cmhb.portal.service.security.remoting.SessionSecurityContextHolderSetterFilter] (default task-12) Process URI /home-page(isUriSecure=false)
> 2015-10-01 14:44:57,737 DEBUG [cz.cmhb.portal.service.security.remoting.SessionSecurityContextHolderSetterFilter] (default task-12) GET: Session id = UcZtmad7hG2alDsqlrb2OykXULT4AJBv7UAzmWz_
> 2015-10-01 14:44:57,737 DEBUG [cz.cmhb.portal.service.security.remoting.SessionSecurityContextHolderSetterFilter] (default task-12) securityContext is NULL, session id = UcZtmad7hG2alDsqlrb2OykXULT4AJBv7UAzmWz_
> 2015-10-01 14:44:57,738 ERROR [cz.cmhb.portal.service.security.remoting.SessionSecurityContextHolderSetterFilter] (default task-12) Unauthorized access, you must login before
> 2015-10-01 14:44:57,739 DEBUG [cz.cmhb.portal.service.security.remoting.SessionSecurityContextHolderSetterFilter] (default task-12) Sending redirect = /informatorium/login?backUrl=/informatorium/home-page
> 2015-10-01 14:44:57,743 TRACE [org.wildfly.clustering.web.infinispan] (default task-12) Session UcZtmad7hG2alDsqlrb2OykXULT4AJBv7UAzmWz_ will expire in 120000 ms
> 2015-10-01 14:44:57,867 DEBUG [cz.cmhb.portal.service.security.remoting.SessionSecurityContextHolderSetterFilter] (default task-13) Process URI /login(isUriSecure=true)
> 2015-10-01 14:44:57,868 DEBUG [cz.cmhb.portal.service.security.remoting.SessionSecurityContextHolderSetterFilter] (default task-13) GET: Session id = UcZtmad7hG2alDsqlrb2OykXULT4AJBv7UAzmWz_
> 2015-10-01 14:44:57,868 DEBUG [cz.cmhb.portal.service.security.remoting.SessionSecurityContextHolderSetterFilter] (default task-13) securityContext is NULL, session id = UcZtmad7hG2alDsqlrb2OykXULT4AJBv7UAzmWz_
> 2015-10-01 14:44:58,128 TRACE [org.wildfly.clustering.web.infinispan] (default task-13) Session UcZtmad7hG2alDsqlrb2OykXULT4AJBv7UAzmWz_ will expire in 120000 ms
> {noformat}
--
This message was sent by Atlassian JIRA
(v6.4.11#64026)
9 years, 2 months
[JBoss JIRA] (WFLY-5158) Execution error: org.infinispan.util.concurrent.TimeoutException: Replication timeout for node_name
by Michal Vinkler (JIRA)
[ https://issues.jboss.org/browse/WFLY-5158?page=com.atlassian.jira.plugin.... ]
Michal Vinkler commented on WFLY-5158:
--------------------------------------
Still present in EAP 7.0.0.DR11:
{code}
[JBossINF] [0m[31m16:44:33,553 ERROR [org.infinispan.interceptors.InvocationContextInterceptor] (default task-128) ISPN000136: Execution error: org.infinispan.util.concurrent.TimeoutException: Replication timeout for perf20
[JBossINF] at org.infinispan.remoting.transport.jgroups.JGroupsTransport.checkRsp(JGroupsTransport.java:755)
[JBossINF] at org.infinispan.remoting.transport.jgroups.JGroupsTransport.lambda$invokeRemotelyAsync$81(JGroupsTransport.java:602)
[JBossINF] at java.util.concurrent.CompletableFuture.uniApply(CompletableFuture.java:602)
[JBossINF] at java.util.concurrent.CompletableFuture$UniApply.tryFire(CompletableFuture.java:577)
[JBossINF] at java.util.concurrent.CompletableFuture.postComplete(CompletableFuture.java:474)
[JBossINF] at java.util.concurrent.CompletableFuture.complete(CompletableFuture.java:1962)
[JBossINF] at org.infinispan.remoting.transport.jgroups.RspListFuture.call(RspListFuture.java:47)
[JBossINF] at org.infinispan.remoting.transport.jgroups.RspListFuture.call(RspListFuture.java:16)
[JBossINF] at java.util.concurrent.FutureTask.run(FutureTask.java:266)
[JBossINF] at java.util.concurrent.ScheduledThreadPoolExecutor$ScheduledFutureTask.access$201(ScheduledThreadPoolExecutor.java:180)
[JBossINF] at java.util.concurrent.ScheduledThreadPoolExecutor$ScheduledFutureTask.run(ScheduledThreadPoolExecutor.java:293)
[JBossINF] at java.util.concurrent.ThreadPoolExecutor.runWorker(ThreadPoolExecutor.java:1142)
[JBossINF] at java.util.concurrent.ThreadPoolExecutor$Worker.run(ThreadPoolExecutor.java:617)
[JBossINF] at java.lang.Thread.run(Thread.java:745)
{code}
Also, this WARN message is related:
{code}
[JBossINF] [0m[33m16:44:33,555 WARN [org.jboss.as.txn] (default task-89) WFLYTX0027: The pre-jca synchronization org.jboss.as.ejb3.component.stateful.StatefulSessionSynchronizationInterceptor$StatefulSessionSynchronization@775d5d66 associated with tx TransactionImple < ac, BasicAction: 0:ffff0a105a36:-2ed0eb04:560af7f1:ae5 status: ActionStatus.COMMITTED > failed during after completion: org.infinispan.util.concurrent.TimeoutException: Replication timeout for perf21
[JBossINF] at org.infinispan.remoting.transport.jgroups.JGroupsTransport.checkRsp(JGroupsTransport.java:755)
[JBossINF] at org.infinispan.remoting.transport.jgroups.JGroupsTransport.lambda$invokeRemotelyAsync$81(JGroupsTransport.java:602)
[JBossINF] at java.util.concurrent.CompletableFuture.uniApply(CompletableFuture.java:602)
[JBossINF] at java.util.concurrent.CompletableFuture$UniApply.tryFire(CompletableFuture.java:577)
[JBossINF] at java.util.concurrent.CompletableFuture.postComplete(CompletableFuture.java:474)
[JBossINF] at java.util.concurrent.CompletableFuture.complete(CompletableFuture.java:1962)
[JBossINF] at org.infinispan.remoting.transport.jgroups.RspListFuture.call(RspListFuture.java:47)
[JBossINF] at org.infinispan.remoting.transport.jgroups.RspListFuture.call(RspListFuture.java:16)
[JBossINF] at java.util.concurrent.FutureTask.run(FutureTask.java:266)
[JBossINF] at java.util.concurrent.ScheduledThreadPoolExecutor$ScheduledFutureTask.access$201(ScheduledThreadPoolExecutor.java:180)
[JBossINF] at java.util.concurrent.ScheduledThreadPoolExecutor$ScheduledFutureTask.run(ScheduledThreadPoolExecutor.java:293)
[JBossINF] at java.util.concurrent.ThreadPoolExecutor.runWorker(ThreadPoolExecutor.java:1142)
[JBossINF] at java.util.concurrent.ThreadPoolExecutor$Worker.run(ThreadPoolExecutor.java:617)
[JBossINF] at java.lang.Thread.run(Thread.java:745)
{code}
Server log:
http://jenkins.mw.lab.eng.bos.redhat.com/hudson/job/eap-7x-failover-ejb-e...
> Execution error: org.infinispan.util.concurrent.TimeoutException: Replication timeout for node_name
> ---------------------------------------------------------------------------------------------------
>
> Key: WFLY-5158
> URL: https://issues.jboss.org/browse/WFLY-5158
> Project: WildFly
> Issue Type: Bug
> Components: Clustering
> Affects Versions: 10.0.0.Beta1, 10.0.0.CR2
> Reporter: Michal Vinkler
> Assignee: Paul Ferraro
>
> Seen in ejb-ejbservlet and http-session scenarios intermittently (no matter what failover type or cache is used).
> When node perf18 is restarted after failover other servers log this error several times:
> {code}
> [JBossINF] [0m[31m16:11:43,595 ERROR [org.infinispan.interceptors.InvocationContextInterceptor] (default task-107) ISPN000136: Execution error: org.infinispan.util.concurrent.TimeoutException: Replication timeout for perf18
> [JBossINF] at org.infinispan.remoting.transport.jgroups.JGroupsTransport.checkRsp(JGroupsTransport.java:752)
> [JBossINF] at org.infinispan.remoting.transport.jgroups.JGroupsTransport.lambda$invokeRemotelyAsync$6(JGroupsTransport.java:599)
> [JBossINF] at org.infinispan.remoting.transport.jgroups.JGroupsTransport$$Lambda$34/238012590.apply(Unknown Source)
> [JBossINF] at java.util.concurrent.CompletableFuture.uniApply(CompletableFuture.java:602)
> [JBossINF] at java.util.concurrent.CompletableFuture$UniApply.tryFire(CompletableFuture.java:577)
> [JBossINF] at java.util.concurrent.CompletableFuture.postComplete(CompletableFuture.java:474)
> [JBossINF] at java.util.concurrent.CompletableFuture.complete(CompletableFuture.java:1954)
> [JBossINF] at org.infinispan.remoting.transport.jgroups.RspListFuture.timeout(RspListFuture.java:40)
> [JBossINF] at org.infinispan.remoting.transport.jgroups.CommandAwareRpcDispatcher$$Lambda$32/2073718099.run(Unknown Source)
> [JBossINF] at java.util.concurrent.Executors$RunnableAdapter.call(Executors.java:511)
> [JBossINF] at java.util.concurrent.FutureTask.run(FutureTask.java:266)
> [JBossINF] at java.util.concurrent.ScheduledThreadPoolExecutor$ScheduledFutureTask.access$201(ScheduledThreadPoolExecutor.java:180)
> [JBossINF] at java.util.concurrent.ScheduledThreadPoolExecutor$ScheduledFutureTask.run(ScheduledThreadPoolExecutor.java:293)
> [JBossINF] at java.util.concurrent.ThreadPoolExecutor.runWorker(ThreadPoolExecutor.java:1142)
> [JBossINF] at java.util.concurrent.ThreadPoolExecutor$Worker.run(ThreadPoolExecutor.java:617)
> [JBossINF] at java.lang.Thread.run(Thread.java:745)
> {code}
> Server log:
> http://jenkins.mw.lab.eng.bos.redhat.com/hudson/job/eap-7x-failover-ejb-e...
> In this particular test run, after perf18 restarted , perf19 logged the first error in 2 seconds, perf20 in 30 seconds, perf21 in 10 seconds.
> timeline:
> {code}
> perf18: [JBossINF] [0m[0m16:11:42,361 INFO [org.jboss.as] (Controller Boot Thread) WFLYSRV0025: EAP 7.0.0.Alpha1 (WildFly Core 2.0.0.Beta1) started in 20244ms - Started 747 of 993 services (424 services are lazy, passive or on-demand)
> perf19: [JBossINF] [0m[31m16:11:43,595 ERROR [org.infinispan.interceptors.InvocationContextInterceptor] (default task-107) ISPN000136: Execution error: org.infinispan.util.concurrent.TimeoutException: Replication timeout for perf18
> perf20: [JBossINF] [0m[31m16:12:12,836 ERROR [org.infinispan.interceptors.InvocationContextInterceptor] (default task-51) ISPN000136: Execution error: org.infinispan.util.concurrent.TimeoutException: Replication timeout for perf18
> perf21: [JBossINF] [0m[31m16:11:52,826 ERROR [org.infinispan.interceptors.InvocationContextInterceptor] (default task-22) ISPN000136: Execution error: org.infinispan.util.concurrent.TimeoutException: Replication timeout for perf18
> {code}
> This error also intermittently appears after server is shutdown.
> Total number of errors for this particular test run: 1183
--
This message was sent by Atlassian JIRA
(v6.4.11#64026)
9 years, 2 months
[JBoss JIRA] (WFLY-5149) Accept properties file in scripts for starting as a service
by Tomaz Cerar (JIRA)
[ https://issues.jboss.org/browse/WFLY-5149?page=com.atlassian.jira.plugin.... ]
Tomaz Cerar updated WFLY-5149:
------------------------------
Fix Version/s: Awaiting Volunteers
> Accept properties file in scripts for starting as a service
> -----------------------------------------------------------
>
> Key: WFLY-5149
> URL: https://issues.jboss.org/browse/WFLY-5149
> Project: WildFly
> Issue Type: Feature Request
> Components: Scripts
> Affects Versions: 10.0.0.Beta1
> Environment: Microsoft Windows
> Reporter: Roman Syroeshko
> Assignee: Tomaz Cerar
> Fix For: Awaiting Volunteers
>
>
> Currently $JBOSS_HOME\bin\service\service.bat does not allow passing properties file. We run WildFly in domain mode using the followed command.
> {code}
> domain.bat --properties=jboss.properties
> {code}
> Now, it's impossible to install WildFly as a service like that without hacking out-of-the-box files.
--
This message was sent by Atlassian JIRA
(v6.4.11#64026)
9 years, 2 months
[JBoss JIRA] (WFLY-5158) Execution error: org.infinispan.util.concurrent.TimeoutException: Replication timeout for node_name
by Michal Vinkler (JIRA)
[ https://issues.jboss.org/browse/WFLY-5158?page=com.atlassian.jira.plugin.... ]
Michal Vinkler updated WFLY-5158:
---------------------------------
Affects Version/s: 10.0.0.CR2
> Execution error: org.infinispan.util.concurrent.TimeoutException: Replication timeout for node_name
> ---------------------------------------------------------------------------------------------------
>
> Key: WFLY-5158
> URL: https://issues.jboss.org/browse/WFLY-5158
> Project: WildFly
> Issue Type: Bug
> Components: Clustering
> Affects Versions: 10.0.0.Beta1, 10.0.0.CR2
> Reporter: Michal Vinkler
> Assignee: Paul Ferraro
>
> Seen in ejb-ejbservlet and http-session scenarios intermittently (no matter what failover type or cache is used).
> When node perf18 is restarted after failover other servers log this error several times:
> {code}
> [JBossINF] [0m[31m16:11:43,595 ERROR [org.infinispan.interceptors.InvocationContextInterceptor] (default task-107) ISPN000136: Execution error: org.infinispan.util.concurrent.TimeoutException: Replication timeout for perf18
> [JBossINF] at org.infinispan.remoting.transport.jgroups.JGroupsTransport.checkRsp(JGroupsTransport.java:752)
> [JBossINF] at org.infinispan.remoting.transport.jgroups.JGroupsTransport.lambda$invokeRemotelyAsync$6(JGroupsTransport.java:599)
> [JBossINF] at org.infinispan.remoting.transport.jgroups.JGroupsTransport$$Lambda$34/238012590.apply(Unknown Source)
> [JBossINF] at java.util.concurrent.CompletableFuture.uniApply(CompletableFuture.java:602)
> [JBossINF] at java.util.concurrent.CompletableFuture$UniApply.tryFire(CompletableFuture.java:577)
> [JBossINF] at java.util.concurrent.CompletableFuture.postComplete(CompletableFuture.java:474)
> [JBossINF] at java.util.concurrent.CompletableFuture.complete(CompletableFuture.java:1954)
> [JBossINF] at org.infinispan.remoting.transport.jgroups.RspListFuture.timeout(RspListFuture.java:40)
> [JBossINF] at org.infinispan.remoting.transport.jgroups.CommandAwareRpcDispatcher$$Lambda$32/2073718099.run(Unknown Source)
> [JBossINF] at java.util.concurrent.Executors$RunnableAdapter.call(Executors.java:511)
> [JBossINF] at java.util.concurrent.FutureTask.run(FutureTask.java:266)
> [JBossINF] at java.util.concurrent.ScheduledThreadPoolExecutor$ScheduledFutureTask.access$201(ScheduledThreadPoolExecutor.java:180)
> [JBossINF] at java.util.concurrent.ScheduledThreadPoolExecutor$ScheduledFutureTask.run(ScheduledThreadPoolExecutor.java:293)
> [JBossINF] at java.util.concurrent.ThreadPoolExecutor.runWorker(ThreadPoolExecutor.java:1142)
> [JBossINF] at java.util.concurrent.ThreadPoolExecutor$Worker.run(ThreadPoolExecutor.java:617)
> [JBossINF] at java.lang.Thread.run(Thread.java:745)
> {code}
> Server log:
> http://jenkins.mw.lab.eng.bos.redhat.com/hudson/job/eap-7x-failover-ejb-e...
> In this particular test run, after perf18 restarted , perf19 logged the first error in 2 seconds, perf20 in 30 seconds, perf21 in 10 seconds.
> timeline:
> {code}
> perf18: [JBossINF] [0m[0m16:11:42,361 INFO [org.jboss.as] (Controller Boot Thread) WFLYSRV0025: EAP 7.0.0.Alpha1 (WildFly Core 2.0.0.Beta1) started in 20244ms - Started 747 of 993 services (424 services are lazy, passive or on-demand)
> perf19: [JBossINF] [0m[31m16:11:43,595 ERROR [org.infinispan.interceptors.InvocationContextInterceptor] (default task-107) ISPN000136: Execution error: org.infinispan.util.concurrent.TimeoutException: Replication timeout for perf18
> perf20: [JBossINF] [0m[31m16:12:12,836 ERROR [org.infinispan.interceptors.InvocationContextInterceptor] (default task-51) ISPN000136: Execution error: org.infinispan.util.concurrent.TimeoutException: Replication timeout for perf18
> perf21: [JBossINF] [0m[31m16:11:52,826 ERROR [org.infinispan.interceptors.InvocationContextInterceptor] (default task-22) ISPN000136: Execution error: org.infinispan.util.concurrent.TimeoutException: Replication timeout for perf18
> {code}
> This error also intermittently appears after server is shutdown.
> Total number of errors for this particular test run: 1183
--
This message was sent by Atlassian JIRA
(v6.4.11#64026)
9 years, 2 months
[JBoss JIRA] (WFLY-5149) Accept properties file in scripts for starting as a service
by Tomaz Cerar (JIRA)
[ https://issues.jboss.org/browse/WFLY-5149?page=com.atlassian.jira.plugin.... ]
Tomaz Cerar reassigned WFLY-5149:
---------------------------------
Assignee: (was: Tomaz Cerar)
> Accept properties file in scripts for starting as a service
> -----------------------------------------------------------
>
> Key: WFLY-5149
> URL: https://issues.jboss.org/browse/WFLY-5149
> Project: WildFly
> Issue Type: Feature Request
> Components: Scripts
> Affects Versions: 10.0.0.Beta1
> Environment: Microsoft Windows
> Reporter: Roman Syroeshko
> Fix For: Awaiting Volunteers
>
>
> Currently $JBOSS_HOME\bin\service\service.bat does not allow passing properties file. We run WildFly in domain mode using the followed command.
> {code}
> domain.bat --properties=jboss.properties
> {code}
> Now, it's impossible to install WildFly as a service like that without hacking out-of-the-box files.
--
This message was sent by Atlassian JIRA
(v6.4.11#64026)
9 years, 2 months