Dan Smith created GEODE-314:
-------------------------------
Summary: Failure from PartitionManagerDUnitTest.testConcurrent in
CI
Key: GEODE-314
URL: https://issues.apache.org/jira/browse/GEODE-314
Project: Geode
Issue Type: Bug
Reporter: Dan Smith
Assignee: Bruce Schuchardt
This test failed in CI
https://builds.apache.org/job/Geode-nightly/208/testReport/junit/com.gemstone.gemfire.cache.partition/PartitionManagerDUnitTest/testConcurrent/
{noformat}
java.lang.Exception: An exception occured during async invocation
at dunit.AsyncInvocation.getResult(AsyncInvocation.java:186)
at
com.gemstone.gemfire.cache.partition.PartitionManagerDUnitTest.testConcurrent(PartitionManagerDUnitTest.java:414)
at sun.reflect.NativeMethodAccessorImpl.invoke0(Native Method)
at
sun.reflect.NativeMethodAccessorImpl.invoke(NativeMethodAccessorImpl.java:57)
at
sun.reflect.DelegatingMethodAccessorImpl.invoke(DelegatingMethodAccessorImpl.java:43)
at java.lang.reflect.Method.invoke(Method.java:606)
at junit.framework.TestCase.runTest(TestCase.java:176)
at junit.framework.TestCase.runBare(TestCase.java:141)
at junit.framework.TestResult$1.protect(TestResult.java:122)
at junit.framework.TestResult.runProtected(TestResult.java:142)
at junit.framework.TestResult.run(TestResult.java:125)
at junit.framework.TestCase.run(TestCase.java:129)
at junit.framework.TestSuite.runTest(TestSuite.java:252)
at junit.framework.TestSuite.run(TestSuite.java:247)
at
org.junit.internal.runners.JUnit38ClassRunner.run(JUnit38ClassRunner.java:86)
at
org.gradle.api.internal.tasks.testing.junit.JUnitTestClassExecuter.runTestClass(JUnitTestClassExecuter.java:86)
at
org.gradle.api.internal.tasks.testing.junit.JUnitTestClassExecuter.execute(JUnitTestClassExecuter.java:49)
at
org.gradle.api.internal.tasks.testing.junit.JUnitTestClassProcessor.processTestClass(JUnitTestClassProcessor.java:64)
at
org.gradle.api.internal.tasks.testing.SuiteTestClassProcessor.processTestClass(SuiteTestClassProcessor.java:50)
at sun.reflect.GeneratedMethodAccessor14.invoke(Unknown Source)
at
sun.reflect.DelegatingMethodAccessorImpl.invoke(DelegatingMethodAccessorImpl.java:43)
at java.lang.reflect.Method.invoke(Method.java:606)
at
org.gradle.messaging.dispatch.ReflectionDispatch.dispatch(ReflectionDispatch.java:35)
at
org.gradle.messaging.dispatch.ReflectionDispatch.dispatch(ReflectionDispatch.java:24)
at
org.gradle.messaging.dispatch.ContextClassLoaderDispatch.dispatch(ContextClassLoaderDispatch.java:32)
at
org.gradle.messaging.dispatch.ProxyDispatchAdapter$DispatchingInvocationHandler.invoke(ProxyDispatchAdapter.java:93)
at com.sun.proxy.$Proxy2.processTestClass(Unknown Source)
at
org.gradle.api.internal.tasks.testing.worker.TestWorker.processTestClass(TestWorker.java:106)
at sun.reflect.GeneratedMethodAccessor13.invoke(Unknown Source)
at
sun.reflect.DelegatingMethodAccessorImpl.invoke(DelegatingMethodAccessorImpl.java:43)
at java.lang.reflect.Method.invoke(Method.java:606)
at
org.gradle.messaging.dispatch.ReflectionDispatch.dispatch(ReflectionDispatch.java:35)
at
org.gradle.messaging.dispatch.ReflectionDispatch.dispatch(ReflectionDispatch.java:24)
at
org.gradle.messaging.remote.internal.hub.MessageHub$Handler.run(MessageHub.java:360)
at
org.gradle.internal.concurrent.DefaultExecutorFactory$StoppableExecutorImpl$1.run(DefaultExecutorFactory.java:64)
at
java.util.concurrent.ThreadPoolExecutor.runWorker(ThreadPoolExecutor.java:1145)
at
java.util.concurrent.ThreadPoolExecutor$Worker.run(ThreadPoolExecutor.java:615)
at java.lang.Thread.run(Thread.java:745)
Caused by: dunit.RMIException: While invoking
com.gemstone.gemfire.cache.partition.PartitionManagerDUnitTest$17.run in VM 1
running on Host asf902.gq1.ygridcore.net with 4 VMs
at dunit.VM.invoke(VM.java:359)
at dunit.VM$2.run(VM.java:211)
at java.lang.Thread.run(Thread.java:745)
at dunit.AsyncInvocation.run(AsyncInvocation.java:200)
Caused by: com.gemstone.gemfire.InternalGemFireError: recordVersion invoked for
a local version tag that is higher than our local version.
rvv=RegionVersionVector{rv0 gc0}@1277419153, tag={v1; rv1;
mbr=asf902<v1300>:34949; time=1441600063882; remote} region /__PR/_B__region1_5
at Remote Member 'asf902(19609)<v1300>:34949' in
com.gemstone.gemfire.internal.Assert.throwError(Assert.java:82)
at Remote Member 'asf902(19609)<v1300>:34949' in
com.gemstone.gemfire.internal.Assert.fail(Assert.java:57)
at Remote Member 'asf902(19609)<v1300>:34949' in
com.gemstone.gemfire.internal.cache.versions.RegionVersionVector.recordVersion(RegionVersionVector.java:586)
at Remote Member 'asf902(19609)<v1300>:34949' in
com.gemstone.gemfire.internal.cache.InitialImageOperation.processChunk(InitialImageOperation.java:1005)
at Remote Member 'asf902(19609)<v1300>:34949' in
com.gemstone.gemfire.internal.cache.InitialImageOperation$ImageProcessor.process(InitialImageOperation.java:1314)
at Remote Member 'asf902(19609)<v1300>:34949' in
com.gemstone.gemfire.distributed.internal.ReplyMessage.process(ReplyMessage.java:222)
at Remote Member 'asf902(19609)<v1300>:34949' in
com.gemstone.gemfire.internal.cache.InitialImageOperation$ImageReplyMessage.process(InitialImageOperation.java:2808)
at Remote Member 'asf902(19609)<v1300>:34949' in
com.gemstone.gemfire.distributed.internal.ReplyMessage.dmProcess(ReplyMessage.java:203)
at Remote Member 'asf902(19609)<v1300>:34949' in
com.gemstone.gemfire.distributed.internal.ReplyMessage.process(ReplyMessage.java:192)
at Remote Member 'asf902(19609)<v1300>:34949' in
com.gemstone.gemfire.distributed.internal.DistributionMessage.scheduleAction(DistributionMessage.java:371)
at Remote Member 'asf902(19609)<v1300>:34949' in
com.gemstone.gemfire.distributed.internal.DistributionMessage$1.run(DistributionMessage.java:442)
at Remote Member 'asf902(19609)<v1300>:34949' in
java.util.concurrent.ThreadPoolExecutor.runWorker(ThreadPoolExecutor.java:1145)
at Remote Member 'asf902(19609)<v1300>:34949' in
java.util.concurrent.ThreadPoolExecutor$Worker.run(ThreadPoolExecutor.java:615)
at Remote Member 'asf902(19609)<v1300>:34949' in
com.gemstone.gemfire.distributed.internal.DistributionManager.runUntilShutdown(DistributionManager.java:692)
at Remote Member 'asf902(19609)<v1300>:34949' in
com.gemstone.gemfire.distributed.internal.DistributionManager$5$1.run(DistributionManager.java:1000)
at Remote Member 'asf902(19609)<v1300>:34949' in
java.lang.Thread.run(Thread.java:745)
at
com.gemstone.gemfire.distributed.internal.ReplyException.handleAsUnexpected(ReplyException.java:79)
at
com.gemstone.gemfire.internal.cache.InitialImageOperation.getFromOne(InitialImageOperation.java:530)
at
com.gemstone.gemfire.internal.cache.DistributedRegion.getInitialImageAndRecovery(DistributedRegion.java:1429)
at
com.gemstone.gemfire.internal.cache.DistributedRegion.initialize(DistributedRegion.java:1215)
at
com.gemstone.gemfire.internal.cache.BucketRegion.initialize(BucketRegion.java:290)
at
com.gemstone.gemfire.internal.cache.LocalRegion.createSubregion(LocalRegion.java:1059)
at
com.gemstone.gemfire.internal.cache.PartitionedRegionDataStore.createBucketRegion(PartitionedRegionDataStore.java:800)
at
com.gemstone.gemfire.internal.cache.PartitionedRegionDataStore.grabFreeBucket(PartitionedRegionDataStore.java:477)
at
com.gemstone.gemfire.internal.cache.PartitionedRegionDataStore.grabBucket(PartitionedRegionDataStore.java:3013)
at
com.gemstone.gemfire.internal.cache.PRHARedundancyProvider.createBackupBucketOnMember(PRHARedundancyProvider.java:1140)
at
com.gemstone.gemfire.cache.partition.PartitionManager.createBucket(PartitionManager.java:249)
at
com.gemstone.gemfire.cache.partition.PartitionManager.createPrimaryBucket(PartitionManager.java:200)
at
com.gemstone.gemfire.cache.partition.PartitionManagerDUnitTest$17.run(PartitionManagerDUnitTest.java:372)
at sun.reflect.NativeMethodAccessorImpl.invoke0(Native Method)
at
sun.reflect.NativeMethodAccessorImpl.invoke(NativeMethodAccessorImpl.java:57)
at
sun.reflect.DelegatingMethodAccessorImpl.invoke(DelegatingMethodAccessorImpl.java:43)
at java.lang.reflect.Method.invoke(Method.java:606)
at hydra.MethExecutor.executeObject(MethExecutor.java:258)
at
dunit.standalone.RemoteDUnitVM.executeMethodOnObject(RemoteDUnitVM.java:67)
at sun.reflect.GeneratedMethodAccessor8.invoke(Unknown Source)
at
sun.reflect.DelegatingMethodAccessorImpl.invoke(DelegatingMethodAccessorImpl.java:43)
at java.lang.reflect.Method.invoke(Method.java:606)
at sun.rmi.server.UnicastServerRef.dispatch(UnicastServerRef.java:322)
at sun.rmi.transport.Transport$1.run(Transport.java:177)
at sun.rmi.transport.Transport$1.run(Transport.java:174)
at java.security.AccessController.doPrivileged(Native Method)
at sun.rmi.transport.Transport.serviceCall(Transport.java:173)
at
sun.rmi.transport.tcp.TCPTransport.handleMessages(TCPTransport.java:556)
at
sun.rmi.transport.tcp.TCPTransport$ConnectionHandler.run0(TCPTransport.java:811)
at
sun.rmi.transport.tcp.TCPTransport$ConnectionHandler.run(TCPTransport.java:670)
at
java.util.concurrent.ThreadPoolExecutor.runWorker(ThreadPoolExecutor.java:1145)
at
java.util.concurrent.ThreadPoolExecutor$Worker.run(ThreadPoolExecutor.java:615)
at java.lang.Thread.run(Thread.java:745)
[setup] START TEST PartitionManagerDUnitTest.testConcurrent
[vm_2][info 2015/09/07 04:27:52.264 UTC <RMI TCP Connection(90)-67.195.81.146>
tid=0x29e4] Received method:
com.gemstone.gemfire.cache30.CacheTestCase.remoteTearDown with 0 args
[vm_2]
[vm_2][info 2015/09/07 04:27:52.265 UTC <RMI TCP Connection(90)-67.195.81.146>
tid=0x29e4] Got result: null
[vm_2] from com.gemstone.gemfire.cache30.CacheTestCase.remoteTearDown with 0
args (took 1 ms)
[vm_2]
[vm_2][info 2015/09/07 04:27:52.269 UTC <RMI TCP Connection(90)-67.195.81.146>
tid=0x29e4] Received method: dunit.DistributedTestCase.cleanupThisVM with 0 args
[vm_2]
[vm_2][info 2015/09/07 04:27:52.269 UTC <RMI TCP Connection(90)-67.195.81.146>
tid=0x29e4] Got result: null
[vm_2] from dunit.DistributedTestCase.cleanupThisVM with 0 args (took 0 ms)
[vm_2]
[locator][info 2015/09/07 04:27:52.271 UTC <RMI TCP
Connection(22)-67.195.81.146> tid=0x11] Received method:
dunit.DistributedTestCase$5.run with 0 args on object:
dunit.DistributedTestCase$5@57f08a50
[locator]
[locator][info 2015/09/07 04:27:52.271 UTC <RMI TCP
Connection(22)-67.195.81.146> tid=0x11] Got result: null
[locator] from dunit.DistributedTestCase$5.run with 0 args on object:
dunit.DistributedTestCase$5@57f08a50 (took 0 ms)
[locator]
{noformat}
There was an old GemFire bug that looked similar that is now closed - 50566
--
This message was sent by Atlassian JIRA
(v6.3.4#6332)
