search

wu560130911 / hibernate-memcached

Automatically exported from code.google.com/p/hibernate-memcached
0 stars 0 forks source link

Memcached restart during fetch operation #4

Closed GoogleCodeExporter closed 9 years ago

GoogleCodeExporter commented 9 years ago 
Steps will reproduce the problem:
1. Configure second-level cache via hibernate-memcached 1.0
2. Start AS
3. Restart memcached while performing some operation with EntityManager.

com.googlecode.hibernate.memcached.MemcachedCache.get() will throw an
ChatException: Exception waiting for value. Due to this exception
EntityManager.find() and Query.getSingleResult() fail and do not return
expected value. I suppose that in this case expected entity must be fetched
from database. I don't know whether this is an issue of hibernate or
hibernate-memcached or this is even an expected behavior.

Original issue reported on code.google.com by A.Dolga...@gmail.com on 24 Oct 2008 at 9:33

GoogleCodeExporter commented 9 years ago 
Thanks!
Can I get a copy of a stacktrace please?
There is no such "ChatException" anywhere in the classpath the project right 
now. So
I'm not sure where the error is coming from.

Original comment by raykrue...@gmail.com on 24 Oct 2008 at 10:06

GoogleCodeExporter commented 9 years ago 
Also, let me state what you should see the scenario you mentioned. What you 
should
more than likely see is an "OperationTimeoutException" logged at WARN level. The
message should be something like "Cache 'get' timed out for key [blah]" 
followed by a
stack trace. When this happens the cache will return null which will force 
Hibernate
to go to the database.

Original comment by raykrue...@gmail.com on 24 Oct 2008 at 10:56

GoogleCodeExporter commented 9 years ago 
Sorry for "ChatException", I've meant "CacheException"
(http://www.hibernate.org/hib_docs/v3/api/org/hibernate/cache/CacheException.htm
l)

Here is stack trace:

2008-10-24 14:20:39,101 DEBUG [org.hibernate.cache.NonstrictReadWriteCache] 
Cache
lookup: <XXX>.persistence.user.User#2
2008-10-24 14:20:39,101 DEBUG
[com.googlecode.hibernate.memcached.HashCodeKeyStrategy] Transformed key
[<XXX>.persistence.user.User#2] to hashCode [2]
2008-10-24 14:20:39,102 DEBUG
[com.googlecode.hibernate.memcached.HashCodeKeyStrategy] Final cache key:
[Konfero_ear,BusinessModule_jar,konfero.<XXX>.persistence.user.User:0:2]
2008-10-24 14:20:39,102 DEBUG 
[com.googlecode.hibernate.memcached.MemcachedCache]
Memcache.get(Konfero_ear,BusinessModule_jar,konfero.<XXX>.persistence.user.User:
0:2)
2008-10-24 14:20:39,102 DEBUG
[com.googlecode.hibernate.memcached.spymemcached.SpyMemcache]
MemcachedClient.get(Konfero_ear,BusinessModule_jar,konfero.<XXX>.persistence.use
r.User:0:2)
2008-10-24 14:20:39,102 ERROR [STDERR] 2008-10-24 14:20:39.102
2008-10-24 14:20:39,102 ERROR [STDERR]  
2008-10-24 14:20:39,103 ERROR [STDERR] INFO
2008-10-24 14:20:39,103 ERROR [STDERR]  
2008-10-24 14:20:39,103 ERROR [STDERR] net.spy.memcached.MemcachedConnection
2008-10-24 14:20:39,103 ERROR [STDERR] :  
2008-10-24 14:20:39,103 ERROR [STDERR] Reconnecting due to exception on {QA
sa=localhost/127.0.0.1:11211, #Rops=1, #Wops=0, #iq=0,
topRop=net.spy.memcached.protocol.ascii.GetOperationImpl@2a28ff7, topWop=null,
toWrite=0, interested=1}
2008-10-24 14:20:39,103 ERROR [STDERR] java.io.IOException: Disconnected
2008-10-24 14:20:39,103 ERROR [STDERR]  at
net.spy.memcached.MemcachedConnection.handleReads(MemcachedConnection.java:298)
2008-10-24 14:20:39,103 ERROR [STDERR]  at
net.spy.memcached.MemcachedConnection.handleIO(MemcachedConnection.java:263)
2008-10-24 14:20:39,103 ERROR [STDERR]  at
net.spy.memcached.MemcachedConnection.handleIO(MemcachedConnection.java:183)
2008-10-24 14:20:39,103 ERROR [STDERR]  at
net.spy.memcached.MemcachedClient.run(MemcachedClient.java:1248)
2008-10-24 14:20:39,103 ERROR [STDERR] 2008-10-24 14:20:39.103
2008-10-24 14:20:39,103 ERROR [STDERR]  
2008-10-24 14:20:39,103 ERROR [STDERR] WARN
2008-10-24 14:20:39,103 ERROR [STDERR]  
2008-10-24 14:20:39,104 ERROR [STDERR] net.spy.memcached.MemcachedConnection
2008-10-24 14:20:39,104 ERROR [STDERR] :  
2008-10-24 14:20:39,104 ERROR [STDERR] Closing, and reopening {QA
sa=localhost/127.0.0.1:11211, #Rops=1, #Wops=0, #iq=0,
topRop=net.spy.memcached.protocol.ascii.GetOperationImpl@2a28ff7, topWop=null,
toWrite=0, interested=1}, attempt 0.
2008-10-24 14:20:39,104 ERROR [STDERR] 2008-10-24 14:20:39.104
2008-10-24 14:20:39,104 ERROR [STDERR]  
2008-10-24 14:20:39,104 ERROR [STDERR] WARN
2008-10-24 14:20:39,104 ERROR [STDERR]  
2008-10-24 14:20:39,104 ERROR [STDERR]
net.spy.memcached.protocol.ascii.AsciiMemcachedNodeImpl
2008-10-24 14:20:39,104 ERROR [STDERR] :  
2008-10-24 14:20:39,104 ERROR [STDERR] Discarding partially completed op:
net.spy.memcached.protocol.ascii.GetOperationImpl@2a28ff7
2008-10-24 14:20:39,106 ERROR [<XXX>.util.ExceptionLogger] Exception waiting 
for value
javax.ejb.EJBTransactionRolledbackException: Exception waiting for value
    at org.jboss.ejb3.tx.Ejb3TxPolicy.handleInCallerTx(Ejb3TxPolicy.java:87)
    at org.jboss.aspects.tx.TxPolicy.invokeInCallerTx(TxPolicy.java:130)
    at org.jboss.aspects.tx.TxInterceptor$Required.invoke(TxInterceptor.java:195)
    at org.jboss.aop.joinpoint.MethodInvocation.invokeNext(MethodInvocation.java:101)
    at
org.jboss.aspects.tx.TxPropagationInterceptor.invoke(TxPropagationInterceptor.ja
va:95)
    at org.jboss.aop.joinpoint.MethodInvocation.invokeNext(MethodInvocation.java:101)
    at
org.jboss.ejb3.stateless.StatelessInstanceInterceptor.invoke(StatelessInstanceIn
terceptor.java:62)
    at org.jboss.aop.joinpoint.MethodInvocation.invokeNext(MethodInvocation.java:101)
    at
org.jboss.aspects.security.AuthenticationInterceptor.invoke(AuthenticationInterc
eptor.java:77)
    at
org.jboss.ejb3.security.Ejb3AuthenticationInterceptor.invoke(Ejb3AuthenticationI
nterceptor.java:110)
    at org.jboss.aop.joinpoint.MethodInvocation.invokeNext(MethodInvocation.java:101)
    at org.jboss.ejb3.ENCPropagationInterceptor.invoke(ENCPropagationInterceptor.java:46)
    at org.jboss.aop.joinpoint.MethodInvocation.invokeNext(MethodInvocation.java:101)
    at
org.jboss.ejb3.asynchronous.AsynchronousInterceptor.invoke(AsynchronousIntercept
or.java:106)
    at org.jboss.aop.joinpoint.MethodInvocation.invokeNext(MethodInvocation.java:101)
    at org.jboss.ejb3.stateless.StatelessContainer.localInvoke(StatelessContainer.java:240)
    at org.jboss.ejb3.stateless.StatelessContainer.localInvoke(StatelessContainer.java:210)
    at org.jboss.ejb3.stateless.StatelessLocalProxy.invoke(StatelessLocalProxy.java:84)
    at $Proxy123.getByConditionUnique(Unknown Source)
    at <XXX>.service.impl.ChatServiceBean.getSession(ChatServiceBean.java:231)
    at <XXX>.service.impl.ChatServiceBean.getSession(ChatServiceBean.java:219)
    at <XXX>.service.impl.ChatServiceBean.getMessages(ChatServiceBean.java:591)
    at sun.reflect.GeneratedMethodAccessor110.invoke(Unknown Source)
    at sun.reflect.DelegatingMethodAccessorImpl.invoke(DelegatingMethodAccessorImpl.java:25)
    at java.lang.reflect.Method.invoke(Method.java:597)
    at org.jboss.aop.joinpoint.MethodInvocation.invokeNext(MethodInvocation.java:112)
    at
org.jboss.ejb3.interceptor.InvocationContextImpl.proceed(InvocationContextImpl.j
ava:166)
    at <XXX>.util.ExceptionLogger.logMethodEntry(ExceptionLogger.java:16)
    at sun.reflect.GeneratedMethodAccessor106.invoke(Unknown Source)
    at sun.reflect.DelegatingMethodAccessorImpl.invoke(DelegatingMethodAccessorImpl.java:25)
    at java.lang.reflect.Method.invoke(Method.java:597)
    at
org.jboss.ejb3.interceptor.InvocationContextImpl.proceed(InvocationContextImpl.j
ava:118)
    at
org.jboss.ejb3.interceptor.EJB3InterceptorsInterceptor.invoke(EJB3InterceptorsIn
terceptor.java:63)
    at org.jboss.aop.joinpoint.MethodInvocation.invokeNext(MethodInvocation.java:101)
    at
org.jboss.ejb3.entity.TransactionScopedEntityManagerInterceptor.invoke(Transacti
onScopedEntityManagerInterceptor.java:54)
    at org.jboss.aop.joinpoint.MethodInvocation.invokeNext(MethodInvocation.java:101)
    at
org.jboss.ejb3.AllowedOperationsInterceptor.invoke(AllowedOperationsInterceptor.
java:47)
    at org.jboss.aop.joinpoint.MethodInvocation.invokeNext(MethodInvocation.java:101)
    at org.jboss.aspects.tx.TxPolicy.invokeInOurTx(TxPolicy.java:79)
    at org.jboss.aspects.tx.TxInterceptor$Required.invoke(TxInterceptor.java:191)
    at org.jboss.aop.joinpoint.MethodInvocation.invokeNext(MethodInvocation.java:101)
    at
org.jboss.aspects.tx.TxPropagationInterceptor.invoke(TxPropagationInterceptor.ja
va:95)
    at org.jboss.aop.joinpoint.MethodInvocation.invokeNext(MethodInvocation.java:101)
    at
org.jboss.ejb3.stateless.StatelessInstanceInterceptor.invoke(StatelessInstanceIn
terceptor.java:62)
    at org.jboss.aop.joinpoint.MethodInvocation.invokeNext(MethodInvocation.java:101)
    at
org.jboss.aspects.security.AuthenticationInterceptor.invoke(AuthenticationInterc
eptor.java:77)
    at
org.jboss.ejb3.security.Ejb3AuthenticationInterceptor.invoke(Ejb3AuthenticationI
nterceptor.java:110)
    at org.jboss.aop.joinpoint.MethodInvocation.invokeNext(MethodInvocation.java:101)
    at org.jboss.ejb3.ENCPropagationInterceptor.invoke(ENCPropagationInterceptor.java:46)
    at org.jboss.aop.joinpoint.MethodInvocation.invokeNext(MethodInvocation.java:101)
    at
org.jboss.ejb3.asynchronous.AsynchronousInterceptor.invoke(AsynchronousIntercept
or.java:106)
    at org.jboss.aop.joinpoint.MethodInvocation.invokeNext(MethodInvocation.java:101)
    at org.jboss.ejb3.stateless.StatelessContainer.localInvoke(StatelessContainer.java:240)
    at org.jboss.ejb3.stateless.StatelessContainer.localInvoke(StatelessContainer.java:210)
    at org.jboss.ejb3.stateless.StatelessLocalProxy.invoke(StatelessLocalProxy.java:84)
    at $Proxy153.getMessages(Unknown Source)
    at sun.reflect.GeneratedMethodAccessor109.invoke(Unknown Source)
    at sun.reflect.DelegatingMethodAccessorImpl.invoke(DelegatingMethodAccessorImpl.java:25)
    at java.lang.reflect.Method.invoke(Method.java:597)
    at <XXX>.web.proxy.ChatServiceProxy.invoke(ChatServiceProxy.java:51)
    at <XXX>.web.proxy.AbstractServiceProxy.doGet(AbstractServiceProxy.java:118)
    at javax.servlet.http.HttpServlet.service(HttpServlet.java:690)
    at javax.servlet.http.HttpServlet.service(HttpServlet.java:803)
    at
org.apache.catalina.core.ApplicationFilterChain.internalDoFilter(ApplicationFilt
erChain.java:290)
    at
org.apache.catalina.core.ApplicationFilterChain.doFilter(ApplicationFilterChain.
java:206)
    at org.jboss.web.tomcat.filters.ReplyHeaderFilter.doFilter(ReplyHeaderFilter.java:96)
    at
org.apache.catalina.core.ApplicationFilterChain.internalDoFilter(ApplicationFilt
erChain.java:235)
    at
org.apache.catalina.core.ApplicationFilterChain.doFilter(ApplicationFilterChain.
java:206)
    at org.apache.catalina.core.StandardWrapperValve.invoke(StandardWrapperValve.java:230)
    at org.apache.catalina.core.StandardContextValve.invoke(StandardContextValve.java:175)
    at
org.jboss.web.tomcat.security.SecurityAssociationValve.invoke(SecurityAssociatio
nValve.java:182)
    at org.jboss.web.tomcat.security.JaccContextValve.invoke(JaccContextValve.java:84)
    at org.apache.catalina.core.StandardHostValve.invoke(StandardHostValve.java:127)
    at org.apache.catalina.valves.ErrorReportValve.invoke(ErrorReportValve.java:102)
    at
org.jboss.web.tomcat.service.jca.CachedConnectionValve.invoke(CachedConnectionVa
lve.java:157)
    at org.apache.catalina.core.StandardEngineValve.invoke(StandardEngineValve.java:109)
    at org.apache.catalina.connector.CoyoteAdapter.service(CoyoteAdapter.java:262)
    at org.apache.coyote.http11.Http11Processor.process(Http11Processor.java:844)
    at
org.apache.coyote.http11.Http11Protocol$Http11ConnectionHandler.process(Http11Pr
otocol.java:583)
    at org.apache.tomcat.util.net.JIoEndpoint$Worker.run(JIoEndpoint.java:446)
    at java.lang.Thread.run(Thread.java:619)
Caused by: java.lang.RuntimeException: Exception waiting for value
    at net.spy.memcached.MemcachedClient.get(MemcachedClient.java:763)
    at net.spy.memcached.MemcachedClient.get(MemcachedClient.java:778)
    at com.googlecode.hibernate.memcached.spymemcached.SpyMemcache.get(SpyMemcache.java:27)
    at
com.googlecode.hibernate.memcached.MemcachedCache.memcacheGet(MemcachedCache.jav
a:124)
    at com.googlecode.hibernate.memcached.MemcachedCache.get(MemcachedCache.java:153)
    at org.hibernate.cache.NonstrictReadWriteCache.get(NonstrictReadWriteCache.java:44)
    at
org.hibernate.event.def.DefaultLoadEventListener.loadFromSecondLevelCache(Defaul
tLoadEventListener.java:486)
    at
org.hibernate.event.def.DefaultLoadEventListener.doLoad(DefaultLoadEventListener
.java:357)
    at
org.hibernate.event.def.DefaultLoadEventListener.load(DefaultLoadEventListener.j
ava:139)
    at
org.hibernate.event.def.DefaultLoadEventListener.proxyOrLoad(DefaultLoadEventLis
tener.java:195)
    at
org.hibernate.event.def.DefaultLoadEventListener.onLoad(DefaultLoadEventListener
.java:103)
    at org.hibernate.impl.SessionImpl.fireLoad(SessionImpl.java:878)
    at org.hibernate.impl.SessionImpl.internalLoad(SessionImpl.java:846)
    at org.hibernate.type.EntityType.resolveIdentifier(EntityType.java:557)
    at org.hibernate.type.EntityType.resolve(EntityType.java:379)
    at org.hibernate.engine.TwoPhaseLoad.initializeEntity(TwoPhaseLoad.java:116)
    at org.hibernate.loader.Loader.initializeEntitiesAndCollections(Loader.java:854)
    at org.hibernate.loader.Loader.doQuery(Loader.java:729)
    at org.hibernate.loader.Loader.doQueryAndInitializeNonLazyCollections(Loader.java:236)
    at org.hibernate.loader.Loader.doList(Loader.java:2220)
    at org.hibernate.loader.Loader.listIgnoreQueryCache(Loader.java:2104)
    at org.hibernate.loader.Loader.list(Loader.java:2099)
    at org.hibernate.loader.hql.QueryLoader.list(QueryLoader.java:378)
    at org.hibernate.hql.ast.QueryTranslatorImpl.list(QueryTranslatorImpl.java:338)
    at org.hibernate.engine.query.HQLQueryPlan.performList(HQLQueryPlan.java:172)
    at org.hibernate.impl.SessionImpl.list(SessionImpl.java:1121)
    at org.hibernate.impl.QueryImpl.list(QueryImpl.java:79)
    at org.hibernate.ejb.QueryImpl.getSingleResult(QueryImpl.java:80)
    at <XXX>.dao.impl.AbstractDaoImpl.getByConditionUnique(AbstractDaoImpl.java:35)
    at sun.reflect.NativeMethodAccessorImpl.invoke0(Native Method)
    at sun.reflect.NativeMethodAccessorImpl.invoke(NativeMethodAccessorImpl.java:39)
    at sun.reflect.DelegatingMethodAccessorImpl.invoke(DelegatingMethodAccessorImpl.java:25)
    at java.lang.reflect.Method.invoke(Method.java:597)
    at org.jboss.aop.joinpoint.MethodInvocation.invokeNext(MethodInvocation.java:112)
    at
org.jboss.ejb3.interceptor.InvocationContextImpl.proceed(InvocationContextImpl.j
ava:166)
    at
org.jboss.ejb3.interceptor.EJB3InterceptorsInterceptor.invoke(EJB3InterceptorsIn
terceptor.java:63)
    at org.jboss.aop.joinpoint.MethodInvocation.invokeNext(MethodInvocation.java:101)
    at
org.jboss.ejb3.entity.TransactionScopedEntityManagerInterceptor.invoke(Transacti
onScopedEntityManagerInterceptor.java:54)
    at org.jboss.aop.joinpoint.MethodInvocation.invokeNext(MethodInvocation.java:101)
    at
org.jboss.ejb3.AllowedOperationsInterceptor.invoke(AllowedOperationsInterceptor.
java:47)
    at org.jboss.aop.joinpoint.MethodInvocation.invokeNext(MethodInvocation.java:101)
    at org.jboss.aspects.tx.TxPolicy.invokeInCallerTx(TxPolicy.java:126)
    ... 79 more
Caused by: java.util.concurrent.ExecutionException: java.lang.RuntimeException: 
Cancelled
    at net.spy.memcached.MemcachedClient$OperationFuture.get(MemcachedClient.java:1443)
    at net.spy.memcached.MemcachedClient$GetFuture.get(MemcachedClient.java:1489)
    at net.spy.memcached.MemcachedClient.get(MemcachedClient.java:758)
    ... 120 more
Caused by: java.lang.RuntimeException: Cancelled
    ... 123 more
2008-10-24 14:20:39,123 DEBUG 
[org.jboss.ejb3.entity.ManagedEntityManagerFactory]
************** closing entity managersession ********
2008-10-24 14:20:39,134 ERROR [<XXX>.web.proxy.ChatServiceProxy] Error: 
javax.ejb.EJBTransactionRolledbackException: Exception waiting for value
    at org.jboss.ejb3.tx.Ejb3TxPolicy.handleInCallerTx(Ejb3TxPolicy.java:87)
    at org.jboss.aspects.tx.TxPolicy.invokeInCallerTx(TxPolicy.java:130)
    at org.jboss.aspects.tx.TxInterceptor$Required.invoke(TxInterceptor.java:195)
    at org.jboss.aop.joinpoint.MethodInvocation.invokeNext(MethodInvocation.java:101)
    at
org.jboss.aspects.tx.TxPropagationInterceptor.invoke(TxPropagationInterceptor.ja
va:95)
    at org.jboss.aop.joinpoint.MethodInvocation.invokeNext(MethodInvocation.java:101)
    at
org.jboss.ejb3.stateless.StatelessInstanceInterceptor.invoke(StatelessInstanceIn
terceptor.java:62)
    at org.jboss.aop.joinpoint.MethodInvocation.invokeNext(MethodInvocation.java:101)
    at
org.jboss.aspects.security.AuthenticationInterceptor.invoke(AuthenticationInterc
eptor.java:77)
    at
org.jboss.ejb3.security.Ejb3AuthenticationInterceptor.invoke(Ejb3AuthenticationI
nterceptor.java:110)
    at org.jboss.aop.joinpoint.MethodInvocation.invokeNext(MethodInvocation.java:101)
    at org.jboss.ejb3.ENCPropagationInterceptor.invoke(ENCPropagationInterceptor.java:46)
    at org.jboss.aop.joinpoint.MethodInvocation.invokeNext(MethodInvocation.java:101)
    at
org.jboss.ejb3.asynchronous.AsynchronousInterceptor.invoke(AsynchronousIntercept
or.java:106)
    at org.jboss.aop.joinpoint.MethodInvocation.invokeNext(MethodInvocation.java:101)
    at org.jboss.ejb3.stateless.StatelessContainer.localInvoke(StatelessContainer.java:240)
    at org.jboss.ejb3.stateless.StatelessContainer.localInvoke(StatelessContainer.java:210)
    at org.jboss.ejb3.stateless.StatelessLocalProxy.invoke(StatelessLocalProxy.java:84)
    at $Proxy123.getByConditionUnique(Unknown Source)
    at <XXX>.service.impl.ChatServiceBean.getSession(ChatServiceBean.java:231)
    at <XXX>.service.impl.ChatServiceBean.getSession(ChatServiceBean.java:219)
    at <XXX>.service.impl.ChatServiceBean.getMessages(ChatServiceBean.java:591)
    at sun.reflect.GeneratedMethodAccessor110.invoke(Unknown Source)
    at sun.reflect.DelegatingMethodAccessorImpl.invoke(DelegatingMethodAccessorImpl.java:25)
    at java.lang.reflect.Method.invoke(Method.java:597)
    at org.jboss.aop.joinpoint.MethodInvocation.invokeNext(MethodInvocation.java:112)
    at
org.jboss.ejb3.interceptor.InvocationContextImpl.proceed(InvocationContextImpl.j
ava:166)
    at <XXX>.util.ExceptionLogger.logMethodEntry(ExceptionLogger.java:16)
    at sun.reflect.GeneratedMethodAccessor106.invoke(Unknown Source)
    at sun.reflect.DelegatingMethodAccessorImpl.invoke(DelegatingMethodAccessorImpl.java:25)
    at java.lang.reflect.Method.invoke(Method.java:597)
    at
org.jboss.ejb3.interceptor.InvocationContextImpl.proceed(InvocationContextImpl.j
ava:118)
    at
org.jboss.ejb3.interceptor.EJB3InterceptorsInterceptor.invoke(EJB3InterceptorsIn
terceptor.java:63)
    at org.jboss.aop.joinpoint.MethodInvocation.invokeNext(MethodInvocation.java:101)
    at
org.jboss.ejb3.entity.TransactionScopedEntityManagerInterceptor.invoke(Transacti
onScopedEntityManagerInterceptor.java:54)
    at org.jboss.aop.joinpoint.MethodInvocation.invokeNext(MethodInvocation.java:101)
    at
org.jboss.ejb3.AllowedOperationsInterceptor.invoke(AllowedOperationsInterceptor.
java:47)
    at org.jboss.aop.joinpoint.MethodInvocation.invokeNext(MethodInvocation.java:101)
    at org.jboss.aspects.tx.TxPolicy.invokeInOurTx(TxPolicy.java:79)
    at org.jboss.aspects.tx.TxInterceptor$Required.invoke(TxInterceptor.java:191)
    at org.jboss.aop.joinpoint.MethodInvocation.invokeNext(MethodInvocation.java:101)
    at
org.jboss.aspects.tx.TxPropagationInterceptor.invoke(TxPropagationInterceptor.ja
va:95)
    at org.jboss.aop.joinpoint.MethodInvocation.invokeNext(MethodInvocation.java:101)
    at
org.jboss.ejb3.stateless.StatelessInstanceInterceptor.invoke(StatelessInstanceIn
terceptor.java:62)
    at org.jboss.aop.joinpoint.MethodInvocation.invokeNext(MethodInvocation.java:101)
    at
org.jboss.aspects.security.AuthenticationInterceptor.invoke(AuthenticationInterc
eptor.java:77)
    at
org.jboss.ejb3.security.Ejb3AuthenticationInterceptor.invoke(Ejb3AuthenticationI
nterceptor.java:110)
    at org.jboss.aop.joinpoint.MethodInvocation.invokeNext(MethodInvocation.java:101)
    at org.jboss.ejb3.ENCPropagationInterceptor.invoke(ENCPropagationInterceptor.java:46)
    at org.jboss.aop.joinpoint.MethodInvocation.invokeNext(MethodInvocation.java:101)
    at
org.jboss.ejb3.asynchronous.AsynchronousInterceptor.invoke(AsynchronousIntercept
or.java:106)
    at org.jboss.aop.joinpoint.MethodInvocation.invokeNext(MethodInvocation.java:101)
    at org.jboss.ejb3.stateless.StatelessContainer.localInvoke(StatelessContainer.java:240)
    at org.jboss.ejb3.stateless.StatelessContainer.localInvoke(StatelessContainer.java:210)
    at org.jboss.ejb3.stateless.StatelessLocalProxy.invoke(StatelessLocalProxy.java:84)
    at $Proxy153.getMessages(Unknown Source)
    at sun.reflect.GeneratedMethodAccessor109.invoke(Unknown Source)
    at sun.reflect.DelegatingMethodAccessorImpl.invoke(DelegatingMethodAccessorImpl.java:25)
    at java.lang.reflect.Method.invoke(Method.java:597)
    at <XXX>.web.proxy.ChatServiceProxy.invoke(ChatServiceProxy.java:51)
    at <XXX>.web.proxy.AbstractServiceProxy.doGet(AbstractServiceProxy.java:118)
    at javax.servlet.http.HttpServlet.service(HttpServlet.java:690)
    at javax.servlet.http.HttpServlet.service(HttpServlet.java:803)
    at
org.apache.catalina.core.ApplicationFilterChain.internalDoFilter(ApplicationFilt
erChain.java:290)
    at
org.apache.catalina.core.ApplicationFilterChain.doFilter(ApplicationFilterChain.
java:206)
    at org.jboss.web.tomcat.filters.ReplyHeaderFilter.doFilter(ReplyHeaderFilter.java:96)
    at
org.apache.catalina.core.ApplicationFilterChain.internalDoFilter(ApplicationFilt
erChain.java:235)
    at
org.apache.catalina.core.ApplicationFilterChain.doFilter(ApplicationFilterChain.
java:206)
    at org.apache.catalina.core.StandardWrapperValve.invoke(StandardWrapperValve.java:230)
    at org.apache.catalina.core.StandardContextValve.invoke(StandardContextValve.java:175)
    at
org.jboss.web.tomcat.security.SecurityAssociationValve.invoke(SecurityAssociatio
nValve.java:182)
    at org.jboss.web.tomcat.security.JaccContextValve.invoke(JaccContextValve.java:84)
    at org.apache.catalina.core.StandardHostValve.invoke(StandardHostValve.java:127)
    at org.apache.catalina.valves.ErrorReportValve.invoke(ErrorReportValve.java:102)
    at
org.jboss.web.tomcat.service.jca.CachedConnectionValve.invoke(CachedConnectionVa
lve.java:157)
    at org.apache.catalina.core.StandardEngineValve.invoke(StandardEngineValve.java:109)
    at org.apache.catalina.connector.CoyoteAdapter.service(CoyoteAdapter.java:262)
    at org.apache.coyote.http11.Http11Processor.process(Http11Processor.java:844)
    at
org.apache.coyote.http11.Http11Protocol$Http11ConnectionHandler.process(Http11Pr
otocol.java:583)
    at org.apache.tomcat.util.net.JIoEndpoint$Worker.run(JIoEndpoint.java:446)
    at java.lang.Thread.run(Thread.java:619)
Caused by: java.lang.RuntimeException: Exception waiting for value
    at net.spy.memcached.MemcachedClient.get(MemcachedClient.java:763)
    at net.spy.memcached.MemcachedClient.get(MemcachedClient.java:778)
    at com.googlecode.hibernate.memcached.spymemcached.SpyMemcache.get(SpyMemcache.java:27)
    at
com.googlecode.hibernate.memcached.MemcachedCache.memcacheGet(MemcachedCache.jav
a:124)
    at com.googlecode.hibernate.memcached.MemcachedCache.get(MemcachedCache.java:153)
    at org.hibernate.cache.NonstrictReadWriteCache.get(NonstrictReadWriteCache.java:44)
    at
org.hibernate.event.def.DefaultLoadEventListener.loadFromSecondLevelCache(Defaul
tLoadEventListener.java:486)
    at
org.hibernate.event.def.DefaultLoadEventListener.doLoad(DefaultLoadEventListener
.java:357)
    at
org.hibernate.event.def.DefaultLoadEventListener.load(DefaultLoadEventListener.j
ava:139)
    at
org.hibernate.event.def.DefaultLoadEventListener.proxyOrLoad(DefaultLoadEventLis
tener.java:195)
    at
org.hibernate.event.def.DefaultLoadEventListener.onLoad(DefaultLoadEventListener
.java:103)
    at org.hibernate.impl.SessionImpl.fireLoad(SessionImpl.java:878)
    at org.hibernate.impl.SessionImpl.internalLoad(SessionImpl.java:846)
    at org.hibernate.type.EntityType.resolveIdentifier(EntityType.java:557)
    at org.hibernate.type.EntityType.resolve(EntityType.java:379)
    at org.hibernate.engine.TwoPhaseLoad.initializeEntity(TwoPhaseLoad.java:116)
    at org.hibernate.loader.Loader.initializeEntitiesAndCollections(Loader.java:854)
    at org.hibernate.loader.Loader.doQuery(Loader.java:729)
    at org.hibernate.loader.Loader.doQueryAndInitializeNonLazyCollections(Loader.java:236)
    at org.hibernate.loader.Loader.doList(Loader.java:2220)
    at org.hibernate.loader.Loader.listIgnoreQueryCache(Loader.java:2104)
    at org.hibernate.loader.Loader.list(Loader.java:2099)
    at org.hibernate.loader.hql.QueryLoader.list(QueryLoader.java:378)
    at org.hibernate.hql.ast.QueryTranslatorImpl.list(QueryTranslatorImpl.java:338)
    at org.hibernate.engine.query.HQLQueryPlan.performList(HQLQueryPlan.java:172)
    at org.hibernate.impl.SessionImpl.list(SessionImpl.java:1121)
    at org.hibernate.impl.QueryImpl.list(QueryImpl.java:79)
    at org.hibernate.ejb.QueryImpl.getSingleResult(QueryImpl.java:80)
    at <XXX>.dao.impl.AbstractDaoImpl.getByConditionUnique(AbstractDaoImpl.java:35)
    at sun.reflect.NativeMethodAccessorImpl.invoke0(Native Method)
    at sun.reflect.NativeMethodAccessorImpl.invoke(NativeMethodAccessorImpl.java:39)
    at sun.reflect.DelegatingMethodAccessorImpl.invoke(DelegatingMethodAccessorImpl.java:25)
    at java.lang.reflect.Method.invoke(Method.java:597)
    at org.jboss.aop.joinpoint.MethodInvocation.invokeNext(MethodInvocation.java:112)
    at
org.jboss.ejb3.interceptor.InvocationContextImpl.proceed(InvocationContextImpl.j
ava:166)
    at
org.jboss.ejb3.interceptor.EJB3InterceptorsInterceptor.invoke(EJB3InterceptorsIn
terceptor.java:63)
    at org.jboss.aop.joinpoint.MethodInvocation.invokeNext(MethodInvocation.java:101)
    at
org.jboss.ejb3.entity.TransactionScopedEntityManagerInterceptor.invoke(Transacti
onScopedEntityManagerInterceptor.java:54)
    at org.jboss.aop.joinpoint.MethodInvocation.invokeNext(MethodInvocation.java:101)
    at
org.jboss.ejb3.AllowedOperationsInterceptor.invoke(AllowedOperationsInterceptor.
java:47)
    at org.jboss.aop.joinpoint.MethodInvocation.invokeNext(MethodInvocation.java:101)
    at org.jboss.aspects.tx.TxPolicy.invokeInCallerTx(TxPolicy.java:126)
    ... 79 more
Caused by: java.util.concurrent.ExecutionException: java.lang.RuntimeException: 
Cancelled
    at net.spy.memcached.MemcachedClient$OperationFuture.get(MemcachedClient.java:1443)
    at net.spy.memcached.MemcachedClient$GetFuture.get(MemcachedClient.java:1489)
    at net.spy.memcached.MemcachedClient.get(MemcachedClient.java:758)
    ... 120 more
Caused by: java.lang.RuntimeException: Cancelled
    ... 123 more
2008-10-24 14:20:39,206 ERROR [STDERR] 2008-10-24 14:20:39.206
2008-10-24 14:20:39,206 ERROR [STDERR]  
2008-10-24 14:20:39,206 ERROR [STDERR] INFO
2008-10-24 14:20:39,206 ERROR [STDERR]  
2008-10-24 14:20:39,206 ERROR [STDERR] net.spy.memcached.MemcachedConnection
2008-10-24 14:20:39,206 ERROR [STDERR] :  
2008-10-24 14:20:39,206 ERROR [STDERR] Reconnecting {QA 
sa=localhost/127.0.0.1:11211,
#Rops=0, #Wops=0, #iq=1, topRop=null, topWop=null, toWrite=0, interested=0}

Original comment by A.Dolga...@gmail.com on 24 Oct 2008 at 11:28

GoogleCodeExporter commented 9 years ago 
aah ok. Much clearer now thanks.
I'll see if I cna figure out what happened there.

Original comment by raykrue...@gmail.com on 24 Oct 2008 at 12:42

GoogleCodeExporter commented 9 years ago 
Did this error happen continuously or just the first 'get' after you took 
memcached down?

Original comment by raykrue...@gmail.com on 24 Oct 2008 at 1:04

GoogleCodeExporter commented 9 years ago 
This error happens only when I restart memcached. The get method that is being
performed during memcached restart is failed, all other methods are successful.

Original comment by A.Dolga...@gmail.com on 24 Oct 2008 at 2:15

GoogleCodeExporter commented 9 years ago 
aah yeah, ok that makes sense.
Well, thankfully it recovers. I'll be making a change to the way we talk to 
memcached
to eat any errors and log them here shortly. Really any cache failure should not
result in an error bubbling up.

Original comment by raykrue...@gmail.com on 24 Oct 2008 at 2:21

GoogleCodeExporter commented 9 years ago 
Thanks :)

Original comment by A.Dolga...@gmail.com on 24 Oct 2008 at 2:24

GoogleCodeExporter commented 9 years ago 
Marking this as fixed has hibernate-memcached 1.1.x has a new
"MemcacheExceptionHandler" interface. The default interface logs exceptions as 
errors
and does not allow them to bubble up from the memcache client.

Original comment by raykrue...@gmail.com on 5 Jun 2009 at 2:19