[
https://issues.apache.org/jira/browse/IGNITE-2406?page=com.atlassian.jira.plugin.system.issuetabpanels:all-tabpanel
]
Vladimir Ershov updated IGNITE-2406:
------------------------------------
Description:
Rare fail of GridEventStorageCheckAllEventsSelfTest testSuccessTask
log:
{noformat}
------- Stderr: -------
[13:06:47,647][WARN ][main][GridEventStorageCheckAllEventsSelfTest] Peer class
loading is enabled (disable it in production for performance and deployment
consistency reasons)
[13:06:47,659][WARN ][main][GridCollisionManager] Collision resolution is
disabled (all jobs will be activated upon arrival).
[13:06:47,660][WARN ][main][NoopSwapSpaceSpi] Swap space is disabled. To enable
use FileSwapSpaceSpi.
[13:06:48,966][ERROR][main][root] Test failed.
java.lang.AssertionError: Invalid event [evtType=45, expectedType=41,
evts=[TaskEvent
[taskName=org.apache.ignite.internal.GridEventStorageCheckAllEventsSelfTest$GridAllEventsTestTask,
taskClsName=org.apache.ignite.internal.GridEventStorageCheckAllEventsSelfTest$GridAllEventsTestTask,
sesId=e53ddf95251-af0890dd-f87e-4dca-8b22-bab1b6a13404, internal=false,
subjId=af0890dd-f87e-4dca-8b22-bab1b6a13404, nodeId8=af0890dd, msg=Task
started., type=TASK_STARTED, tstamp=1453208808959], JobEvent
[taskName=org.apache.ignite.internal.GridEventStorageCheckAllEventsSelfTest$GridAllEventsTestTask,
taskClsName=org.apache.ignite.internal.GridEventStorageCheckAllEventsSelfTest$GridAllEventsTestTask,
sesId=e53ddf95251-af0890dd-f87e-4dca-8b22-bab1b6a13404,
jobId=063ddf95251-af0890dd-f87e-4dca-8b22-bab1b6a13404,
taskNode=TcpDiscoveryNode [id=af0890dd-f87e-4dca-8b22-bab1b6a13404,
addrs=[127.0.0.1], sockAddrs=[/127.0.0.1:47500], discPort=47500, order=1,
intOrder=1, lastExchangeTime=1453208807679, loc=true,
ver=1.5.1#20160119-sha1:09c1d5e4, isClient=false],
taskSubjId=af0890dd-f87e-4dca-8b22-bab1b6a13404, nodeId8=af0890dd, msg=Job got
mapped., type=JOB_MAPPED, tstamp=1453208808959], JobEvent
[taskName=org.apache.ignite.internal.GridEventStorageCheckAllEventsSelfTest$GridAllEventsTestTask,
taskClsName=org.apache.ignite.internal.GridEventStorageCheckAllEventsSelfTest$GridAllEventsTestTask,
sesId=e53ddf95251-af0890dd-f87e-4dca-8b22-bab1b6a13404,
jobId=063ddf95251-af0890dd-f87e-4dca-8b22-bab1b6a13404,
taskNode=TcpDiscoveryNode [id=af0890dd-f87e-4dca-8b22-bab1b6a13404,
addrs=[127.0.0.1], sockAddrs=[/127.0.0.1:47500], discPort=47500, order=1,
intOrder=1, lastExchangeTime=1453208807679, loc=true,
ver=1.5.1#20160119-sha1:09c1d5e4, isClient=false],
taskSubjId=af0890dd-f87e-4dca-8b22-bab1b6a13404, nodeId8=af0890dd, msg=Job got
queued for computation., type=JOB_QUEUED, tstamp=1453208808959], JobEvent
[taskName=org.apache.ignite.internal.GridEventStorageCheckAllEventsSelfTest$GridAllEventsTestTask,
taskClsName=org.apache.ignite.internal.GridEventStorageCheckAllEventsSelfTest$GridAllEventsTestTask,
sesId=e53ddf95251-af0890dd-f87e-4dca-8b22-bab1b6a13404,
jobId=063ddf95251-af0890dd-f87e-4dca-8b22-bab1b6a13404,
taskNode=TcpDiscoveryNode [id=af0890dd-f87e-4dca-8b22-bab1b6a13404,
addrs=[127.0.0.1], sockAddrs=[/127.0.0.1:47500], discPort=47500, order=1,
intOrder=1, lastExchangeTime=1453208807679, loc=true,
ver=1.5.1#20160119-sha1:09c1d5e4, isClient=false],
taskSubjId=af0890dd-f87e-4dca-8b22-bab1b6a13404, nodeId8=af0890dd, msg=null,
type=JOB_STARTED, tstamp=1453208808959], CheckpointEvent [cpKey=testCheckpoint,
nodeId8=af0890dd, msg=Checkpoint saved: testCheckpoint, type=CHECKPOINT_SAVED,
tstamp=1453208808959], CheckpointEvent [cpKey=testCheckpoint, nodeId8=af0890dd,
msg=Checkpoint removed: testCheckpoint, type=CHECKPOINT_REMOVED,
tstamp=1453208808959], JobEvent
[taskName=org.apache.ignite.internal.GridEventStorageCheckAllEventsSelfTest$GridAllEventsTestTask,
taskClsName=org.apache.ignite.internal.GridEventStorageCheckAllEventsSelfTest$GridAllEventsTestTask,
sesId=e53ddf95251-af0890dd-f87e-4dca-8b22-bab1b6a13404,
jobId=063ddf95251-af0890dd-f87e-4dca-8b22-bab1b6a13404,
taskNode=TcpDiscoveryNode [id=af0890dd-f87e-4dca-8b22-bab1b6a13404,
addrs=[127.0.0.1], sockAddrs=[/127.0.0.1:47500], discPort=47500, order=1,
intOrder=1, lastExchangeTime=1453208807679, loc=true,
ver=1.5.1#20160119-sha1:09c1d5e4, isClient=false],
taskSubjId=af0890dd-f87e-4dca-8b22-bab1b6a13404, nodeId8=af0890dd, msg=null,
type=JOB_FINISHED, tstamp=1453208808959], JobEvent
[taskName=org.apache.ignite.internal.GridEventStorageCheckAllEventsSelfTest$GridAllEventsTestTask,
taskClsName=org.apache.ignite.internal.GridEventStorageCheckAllEventsSelfTest$GridAllEventsTestTask,
sesId=e53ddf95251-af0890dd-f87e-4dca-8b22-bab1b6a13404,
jobId=063ddf95251-af0890dd-f87e-4dca-8b22-bab1b6a13404,
taskNode=TcpDiscoveryNode [id=af0890dd-f87e-4dca-8b22-bab1b6a13404,
addrs=[127.0.0.1], sockAddrs=[/127.0.0.1:47500], discPort=47500, order=1,
intOrder=1, lastExchangeTime=1453208807679, loc=true,
ver=1.5.1#20160119-sha1:09c1d5e4, isClient=false],
taskSubjId=af0890dd-f87e-4dca-8b22-bab1b6a13404, nodeId8=af0890dd, msg=Job got
resulted with: WAIT, type=JOB_RESULTED, tstamp=1453208808959], TaskEvent
[taskName=org.apache.ignite.internal.GridEventStorageCheckAllEventsSelfTest$GridAllEventsTestTask,
taskClsName=org.apache.ignite.internal.GridEventStorageCheckAllEventsSelfTest$GridAllEventsTestTask,
sesId=e53ddf95251-af0890dd-f87e-4dca-8b22-bab1b6a13404, internal=false,
subjId=af0890dd-f87e-4dca-8b22-bab1b6a13404, nodeId8=af0890dd, msg=Task
reduced., type=TASK_REDUCED, tstamp=1453208808959], TaskEvent
[taskName=org.apache.ignite.internal.GridEventStorageCheckAllEventsSelfTest$GridAllEventsTestTask,
taskClsName=org.apache.ignite.internal.GridEventStorageCheckAllEventsSelfTest$GridAllEventsTestTask,
sesId=e53ddf95251-af0890dd-f87e-4dca-8b22-bab1b6a13404, internal=false,
subjId=af0890dd-f87e-4dca-8b22-bab1b6a13404, nodeId8=af0890dd, msg=Task
finished., type=TASK_FINISHED, tstamp=1453208808959]]]
at
org.apache.ignite.internal.GridEventStorageCheckAllEventsSelfTest.assertEvent(GridEventStorageCheckAllEventsSelfTest.java:112)
at
org.apache.ignite.internal.GridEventStorageCheckAllEventsSelfTest.testSuccessTask(GridEventStorageCheckAllEventsSelfTest.java:184)
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
org.apache.ignite.testframework.junits.GridAbstractTest.runTestInternal(GridAbstractTest.java:1699)
at
org.apache.ignite.testframework.junits.GridAbstractTest.access$000(GridAbstractTest.java:116)
at
org.apache.ignite.testframework.junits.GridAbstractTest$4.run(GridAbstractTest.java:1637)
at java.lang.Thread.run(Thread.java:745)
{noformat}
Rare fail of GridEventStorageCheckAllEventsSelfTest.testFailTask
{noformat}
------- Stderr: -------
[19:40:28,931][ERROR][pub-#13981%internal.GridEventStorageCheckAllEventsSelfTest%][GridJobWorker]
Failed to execute job due to unexpected runtime exception
[jobId=de5bf365251-df9117ef-9ddb-46c4-9ef4-16c32d349f6e, ses=GridJobSessionImpl
[ses=GridTaskSessionImpl
[taskName=o.a.i.i.GridEventStorageCheckAllEventsSelfTest$GridAllEventsTestTask,
dep=GridDeployment [ts=1453146028896, depMode=SHARED,
clsLdr=IsolatedClassLoader{roleName='test'},
clsLdrId=9e5bf365251-df9117ef-9ddb-46c4-9ef4-16c32d349f6e, userVer=0, loc=true,
sampleClsName=o.a.i.i.GridEventStorageCheckAllEventsSelfTest$GridAllEventsTestTask,
pendingUndeploy=false, undeployed=false, usage=2],
taskClsName=o.a.i.i.GridEventStorageCheckAllEventsSelfTest$GridAllEventsTestTask,
sesId=be5bf365251-df9117ef-9ddb-46c4-9ef4-16c32d349f6e,
startTime=1453146028927, endTime=9223372036854775807,
taskNodeId=df9117ef-9ddb-46c4-9ef4-16c32d349f6e,
clsLdr=IsolatedClassLoader{roleName='test'}, closed=false, cpSpi=null,
failSpi=null, loadSpi=null, usage=2, fullSup=true,
subjId=df9117ef-9ddb-46c4-9ef4-16c32d349f6e, mapFut=IgniteFuture
[orig=GridFutureAdapter [resFlag=2, res=null, startTime=1453146028927,
endTime=1453146028927, ignoreInterrupts=false, lsnr=null, state=DONE]]],
jobId=de5bf365251-df9117ef-9ddb-46c4-9ef4-16c32d349f6e]]
java.lang.RuntimeException: GridAllEventsFailTestJob expected test exception.
at
org.apache.ignite.internal.GridEventStorageCheckAllEventsSelfTest$GridAllEventsFailTestJob.execute(GridEventStorageCheckAllEventsSelfTest.java:413)
at
org.apache.ignite.internal.GridEventStorageCheckAllEventsSelfTest$GridAllEventsFailTestJob.execute(GridEventStorageCheckAllEventsSelfTest.java:410)
at
org.apache.ignite.internal.processors.job.GridJobWorker$2.call(GridJobWorker.java:509)
at
org.apache.ignite.internal.util.IgniteUtils.wrapThreadLoader(IgniteUtils.java:6407)
at
org.apache.ignite.internal.processors.job.GridJobWorker.execute0(GridJobWorker.java:503)
at
org.apache.ignite.internal.processors.job.GridJobWorker.body(GridJobWorker.java:456)
at
org.apache.ignite.internal.util.worker.GridWorker.run(GridWorker.java:110)
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)
[19:40:28,933][ERROR][test-runner-#14053%internal.GridEventStorageCheckAllEventsSelfTest%][GridTaskWorker]
Failed to obtain remote job result policy for result from
ComputeTask.result(..) method (will fail the whole task): GridJobResultImpl
[job=o.a.i.i.GridEventStorageCheckAllEventsSelfTest$GridAllEventsFailTestJob@16f212b0,
sib=GridJobSiblingImpl
[sesId=be5bf365251-df9117ef-9ddb-46c4-9ef4-16c32d349f6e,
jobId=de5bf365251-df9117ef-9ddb-46c4-9ef4-16c32d349f6e,
nodeId=df9117ef-9ddb-46c4-9ef4-16c32d349f6e, isJobDone=false],
jobCtx=GridJobContextImpl
[jobId=de5bf365251-df9117ef-9ddb-46c4-9ef4-16c32d349f6e, timeoutObj=null,
attrs={}], node=TcpDiscoveryNode [id=df9117ef-9ddb-46c4-9ef4-16c32d349f6e,
addrs=[127.0.0.1], sockAddrs=[/127.0.0.1:47500], discPort=47500, order=1,
intOrder=1, lastExchangeTime=1453146027467, loc=true,
ver=1.5.1#20160118-sha1:67791457, isClient=false], ex=class
o.a.i.compute.ComputeUserUndeclaredException: Failed to execute job due to
unexpected runtime exception
[jobId=de5bf365251-df9117ef-9ddb-46c4-9ef4-16c32d349f6e, ses=GridJobSessionImpl
[ses=GridTaskSessionImpl
[taskName=o.a.i.i.GridEventStorageCheckAllEventsSelfTest$GridAllEventsTestTask,
dep=GridDeployment [ts=1453146028896, depMode=SHARED,
clsLdr=IsolatedClassLoader{roleName='test'},
clsLdrId=9e5bf365251-df9117ef-9ddb-46c4-9ef4-16c32d349f6e, userVer=0, loc=true,
sampleClsName=o.a.i.i.GridEventStorageCheckAllEventsSelfTest$GridAllEventsTestTask,
pendingUndeploy=false, undeployed=false, usage=2],
taskClsName=o.a.i.i.GridEventStorageCheckAllEventsSelfTest$GridAllEventsTestTask,
sesId=be5bf365251-df9117ef-9ddb-46c4-9ef4-16c32d349f6e,
startTime=1453146028927, endTime=9223372036854775807,
taskNodeId=df9117ef-9ddb-46c4-9ef4-16c32d349f6e,
clsLdr=IsolatedClassLoader{roleName='test'}, closed=false, cpSpi=null,
failSpi=null, loadSpi=null, usage=2, fullSup=true,
subjId=df9117ef-9ddb-46c4-9ef4-16c32d349f6e, mapFut=IgniteFuture
[orig=GridFutureAdapter [resFlag=2, res=null, startTime=1453146028927,
endTime=1453146028927, ignoreInterrupts=false, lsnr=null, state=DONE]]],
jobId=de5bf365251-df9117ef-9ddb-46c4-9ef4-16c32d349f6e]], hasRes=true,
isCancelled=false, isOccupied=true]
class org.apache.ignite.IgniteException: Remote job threw user exception
(override or implement ComputeTask.result(..) method if you would like to have
automatic failover for this exception).
at
org.apache.ignite.compute.ComputeTaskAdapter.result(ComputeTaskAdapter.java:101)
at
org.apache.ignite.internal.processors.task.GridTaskWorker$3.apply(GridTaskWorker.java:909)
at
org.apache.ignite.internal.processors.task.GridTaskWorker$3.apply(GridTaskWorker.java:902)
at
org.apache.ignite.internal.util.IgniteUtils.wrapThreadLoader(IgniteUtils.java:6439)
at
org.apache.ignite.internal.processors.task.GridTaskWorker.result(GridTaskWorker.java:902)
at
org.apache.ignite.internal.processors.task.GridTaskWorker.onResponse(GridTaskWorker.java:798)
at
org.apache.ignite.internal.processors.task.GridTaskWorker.processDelayedResponses(GridTaskWorker.java:656)
at
org.apache.ignite.internal.processors.task.GridTaskWorker.body(GridTaskWorker.java:507)
at
org.apache.ignite.internal.util.worker.GridWorker.run(GridWorker.java:110)
at
org.apache.ignite.internal.processors.task.GridTaskProcessor.startTask(GridTaskProcessor.java:678)
at
org.apache.ignite.internal.processors.task.GridTaskProcessor.execute(GridTaskProcessor.java:447)
at
org.apache.ignite.internal.IgniteComputeImpl.execute(IgniteComputeImpl.java:151)
at
org.apache.ignite.internal.GridEventStorageCheckAllEventsSelfTest.generateEvents(GridEventStorageCheckAllEventsSelfTest.java:342)
at
org.apache.ignite.internal.GridEventStorageCheckAllEventsSelfTest.testFailTask(GridEventStorageCheckAllEventsSelfTest.java:196)
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
org.apache.ignite.testframework.junits.GridAbstractTest.runTestInternal(GridAbstractTest.java:1699)
at
org.apache.ignite.testframework.junits.GridAbstractTest.access$000(GridAbstractTest.java:116)
at
org.apache.ignite.testframework.junits.GridAbstractTest$4.run(GridAbstractTest.java:1637)
at java.lang.Thread.run(Thread.java:745)
Caused by: class org.apache.ignite.compute.ComputeUserUndeclaredException:
Failed to execute job due to unexpected runtime exception
[jobId=de5bf365251-df9117ef-9ddb-46c4-9ef4-16c32d349f6e, ses=GridJobSessionImpl
[ses=GridTaskSessionImpl
[taskName=org.apache.ignite.internal.GridEventStorageCheckAllEventsSelfTest$GridAllEventsTestTask,
dep=GridDeployment [ts=1453146028896, depMode=SHARED,
clsLdr=IsolatedClassLoader{roleName='test'},
clsLdrId=9e5bf365251-df9117ef-9ddb-46c4-9ef4-16c32d349f6e, userVer=0, loc=true,
sampleClsName=org.apache.ignite.internal.GridEventStorageCheckAllEventsSelfTest$GridAllEventsTestTask,
pendingUndeploy=false, undeployed=false, usage=2],
taskClsName=org.apache.ignite.internal.GridEventStorageCheckAllEventsSelfTest$GridAllEventsTestTask,
sesId=be5bf365251-df9117ef-9ddb-46c4-9ef4-16c32d349f6e,
startTime=1453146028927, endTime=9223372036854775807,
taskNodeId=df9117ef-9ddb-46c4-9ef4-16c32d349f6e,
clsLdr=IsolatedClassLoader{roleName='test'}, closed=false, cpSpi=null,
failSpi=null, loadSpi=null, usage=2, fullSup=true,
subjId=df9117ef-9ddb-46c4-9ef4-16c32d349f6e, mapFut=IgniteFuture
[orig=GridFutureAdapter [resFlag=2, res=null, startTime=1453146028927,
endTime=1453146028927, ignoreInterrupts=false, lsnr=null, state=DONE]]],
jobId=de5bf365251-df9117ef-9ddb-46c4-9ef4-16c32d349f6e]]
at
org.apache.ignite.internal.processors.job.GridJobWorker.handleThrowable(GridJobWorker.java:607)
at
org.apache.ignite.internal.processors.job.GridJobWorker.execute0(GridJobWorker.java:551)
at
org.apache.ignite.internal.processors.job.GridJobWorker.body(GridJobWorker.java:456)
at
org.apache.ignite.internal.util.worker.GridWorker.run(GridWorker.java:110)
at
java.util.concurrent.ThreadPoolExecutor.runWorker(ThreadPoolExecutor.java:1145)
at
java.util.concurrent.ThreadPoolExecutor$Worker.run(ThreadPoolExecutor.java:615)
... 1 more
Caused by: java.lang.RuntimeException: GridAllEventsFailTestJob expected test
exception.
at
org.apache.ignite.internal.GridEventStorageCheckAllEventsSelfTest$GridAllEventsFailTestJob.execute(GridEventStorageCheckAllEventsSelfTest.java:413)
at
org.apache.ignite.internal.GridEventStorageCheckAllEventsSelfTest$GridAllEventsFailTestJob.execute(GridEventStorageCheckAllEventsSelfTest.java:410)
at
org.apache.ignite.internal.processors.job.GridJobWorker$2.call(GridJobWorker.java:509)
at
org.apache.ignite.internal.util.IgniteUtils.wrapThreadLoader(IgniteUtils.java:6407)
at
org.apache.ignite.internal.processors.job.GridJobWorker.execute0(GridJobWorker.java:503)
... 5 more
[19:40:28,943][ERROR][main][root] Test failed.
java.lang.AssertionError: Invalid event [evtType=48, expectedType=41,
evts=[TaskEvent
[taskName=org.apache.ignite.internal.GridEventStorageCheckAllEventsSelfTest$GridAllEventsTestTask,
taskClsName=org.apache.ignite.internal.GridEventStorageCheckAllEventsSelfTest$GridAllEventsTestTask,
sesId=be5bf365251-df9117ef-9ddb-46c4-9ef4-16c32d349f6e, internal=false,
subjId=df9117ef-9ddb-46c4-9ef4-16c32d349f6e, nodeId8=df9117ef, msg=Task
started., type=TASK_STARTED, tstamp=1453146028927], JobEvent
[taskName=org.apache.ignite.internal.GridEventStorageCheckAllEventsSelfTest$GridAllEventsTestTask,
taskClsName=org.apache.ignite.internal.GridEventStorageCheckAllEventsSelfTest$GridAllEventsTestTask,
sesId=be5bf365251-df9117ef-9ddb-46c4-9ef4-16c32d349f6e,
jobId=de5bf365251-df9117ef-9ddb-46c4-9ef4-16c32d349f6e,
taskNode=TcpDiscoveryNode [id=df9117ef-9ddb-46c4-9ef4-16c32d349f6e,
addrs=[127.0.0.1], sockAddrs=[/127.0.0.1:47500], discPort=47500, order=1,
intOrder=1, lastExchangeTime=1453146027467, loc=true,
ver=1.5.1#20160118-sha1:67791457, isClient=false],
taskSubjId=df9117ef-9ddb-46c4-9ef4-16c32d349f6e, nodeId8=df9117ef, msg=Job got
mapped., type=JOB_MAPPED, tstamp=1453146028927], JobEvent
[taskName=org.apache.ignite.internal.GridEventStorageCheckAllEventsSelfTest$GridAllEventsTestTask,
taskClsName=org.apache.ignite.internal.GridEventStorageCheckAllEventsSelfTest$GridAllEventsTestTask,
sesId=be5bf365251-df9117ef-9ddb-46c4-9ef4-16c32d349f6e,
jobId=de5bf365251-df9117ef-9ddb-46c4-9ef4-16c32d349f6e,
taskNode=TcpDiscoveryNode [id=df9117ef-9ddb-46c4-9ef4-16c32d349f6e,
addrs=[127.0.0.1], sockAddrs=[/127.0.0.1:47500], discPort=47500, order=1,
intOrder=1, lastExchangeTime=1453146027467, loc=true,
ver=1.5.1#20160118-sha1:67791457, isClient=false],
taskSubjId=df9117ef-9ddb-46c4-9ef4-16c32d349f6e, nodeId8=df9117ef, msg=Job got
queued for computation., type=JOB_QUEUED, tstamp=1453146028927], JobEvent
[taskName=org.apache.ignite.internal.GridEventStorageCheckAllEventsSelfTest$GridAllEventsTestTask,
taskClsName=org.apache.ignite.internal.GridEventStorageCheckAllEventsSelfTest$GridAllEventsTestTask,
sesId=be5bf365251-df9117ef-9ddb-46c4-9ef4-16c32d349f6e,
jobId=de5bf365251-df9117ef-9ddb-46c4-9ef4-16c32d349f6e,
taskNode=TcpDiscoveryNode [id=df9117ef-9ddb-46c4-9ef4-16c32d349f6e,
addrs=[127.0.0.1], sockAddrs=[/127.0.0.1:47500], discPort=47500, order=1,
intOrder=1, lastExchangeTime=1453146027467, loc=true,
ver=1.5.1#20160118-sha1:67791457, isClient=false],
taskSubjId=df9117ef-9ddb-46c4-9ef4-16c32d349f6e, nodeId8=df9117ef, msg=null,
type=JOB_STARTED, tstamp=1453146028927], JobEvent
[taskName=org.apache.ignite.internal.GridEventStorageCheckAllEventsSelfTest$GridAllEventsTestTask,
taskClsName=org.apache.ignite.internal.GridEventStorageCheckAllEventsSelfTest$GridAllEventsTestTask,
sesId=be5bf365251-df9117ef-9ddb-46c4-9ef4-16c32d349f6e,
jobId=de5bf365251-df9117ef-9ddb-46c4-9ef4-16c32d349f6e,
taskNode=TcpDiscoveryNode [id=df9117ef-9ddb-46c4-9ef4-16c32d349f6e,
addrs=[127.0.0.1], sockAddrs=[/127.0.0.1:47500], discPort=47500, order=1,
intOrder=1, lastExchangeTime=1453146027467, loc=true,
ver=1.5.1#20160118-sha1:67791457, isClient=false],
taskSubjId=df9117ef-9ddb-46c4-9ef4-16c32d349f6e, nodeId8=df9117ef, msg=Job
failed due to exception [ex=class
org.apache.ignite.compute.ComputeUserUndeclaredException: Failed to execute job
due to unexpected runtime exception
[jobId=de5bf365251-df9117ef-9ddb-46c4-9ef4-16c32d349f6e, ses=GridJobSessionImpl
[ses=GridTaskSessionImpl
[taskName=org.apache.ignite.internal.GridEventStorageCheckAllEventsSelfTest$GridAllEventsTestTask,
dep=GridDeployment [ts=1453146028896, depMode=SHARED,
clsLdr=IsolatedClassLoader{roleName='test'},
clsLdrId=9e5bf365251-df9117ef-9ddb-46c4-9ef4-16c32d349f6e, userVer=0, loc=true,
sampleClsName=org.apache.ignite.internal.GridEventStorageCheckAllEventsSelfTest$GridAllEventsTestTask,
pendingUndeploy=false, undeployed=false, usage=2],
taskClsName=org.apache.ignite.internal.GridEventStorageCheckAllEventsSelfTest$GridAllEventsTestTask,
sesId=be5bf365251-df9117ef-9ddb-46c4-9ef4-16c32d349f6e,
startTime=1453146028927, endTime=9223372036854775807,
taskNodeId=df9117ef-9ddb-46c4-9ef4-16c32d349f6e,
clsLdr=IsolatedClassLoader{roleName='test'}, closed=false, cpSpi=null,
failSpi=null, loadSpi=null, usage=2, fullSup=true,
subjId=df9117ef-9ddb-46c4-9ef4-16c32d349f6e, mapFut=IgniteFuture
[orig=GridFutureAdapter [resFlag=2, res=null, startTime=1453146028927,
endTime=1453146028927, ignoreInterrupts=false, lsnr=null, state=DONE]]],
jobId=de5bf365251-df9117ef-9ddb-46c4-9ef4-16c32d349f6e]],
job=org.apache.ignite.internal.GridEventStorageCheckAllEventsSelfTest$GridAllEventsFailTestJob@16f212b0],
type=JOB_FAILED, tstamp=1453146028927], JobEvent
[taskName=org.apache.ignite.internal.GridEventStorageCheckAllEventsSelfTest$GridAllEventsTestTask,
taskClsName=org.apache.ignite.internal.GridEventStorageCheckAllEventsSelfTest$GridAllEventsTestTask,
sesId=be5bf365251-df9117ef-9ddb-46c4-9ef4-16c32d349f6e,
jobId=de5bf365251-df9117ef-9ddb-46c4-9ef4-16c32d349f6e,
taskNode=TcpDiscoveryNode [id=df9117ef-9ddb-46c4-9ef4-16c32d349f6e,
addrs=[127.0.0.1], sockAddrs=[/127.0.0.1:47500], discPort=47500, order=1,
intOrder=1, lastExchangeTime=1453146027467, loc=true,
ver=1.5.1#20160118-sha1:67791457, isClient=false],
taskSubjId=df9117ef-9ddb-46c4-9ef4-16c32d349f6e, nodeId8=df9117ef, msg=Job got
resulted with: null, type=JOB_RESULTED, tstamp=1453146028927], TaskEvent
[taskName=org.apache.ignite.internal.GridEventStorageCheckAllEventsSelfTest$GridAllEventsTestTask,
taskClsName=org.apache.ignite.internal.GridEventStorageCheckAllEventsSelfTest$GridAllEventsTestTask,
sesId=be5bf365251-df9117ef-9ddb-46c4-9ef4-16c32d349f6e, internal=false,
subjId=df9117ef-9ddb-46c4-9ef4-16c32d349f6e, nodeId8=df9117ef, msg=Task
failed., type=TASK_FAILED, tstamp=1453146028927]]]
at
org.apache.ignite.internal.GridEventStorageCheckAllEventsSelfTest.assertEvent(GridEventStorageCheckAllEventsSelfTest.java:112)
at
org.apache.ignite.internal.GridEventStorageCheckAllEventsSelfTest.testFailTask(GridEventStorageCheckAllEventsSelfTest.java:213)
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
org.apache.ignite.testframework.junits.GridAbstractTest.runTestInternal(GridAbstractTest.java:1699)
at
org.apache.ignite.testframework.junits.GridAbstractTest.access$000(GridAbstractTest.java:116)
at
org.apache.ignite.testframework.junits.GridAbstractTest$4.run(GridAbstractTest.java:1637)
at java.lang.Thread.run(Thread.java:745)
{noformat}
was:
Rare fail of GridEventStorageCheckAllEventsSelfTest testSuccessTask
log:
{noformat}
------- Stderr: -------
[13:06:47,647][WARN ][main][GridEventStorageCheckAllEventsSelfTest] Peer class
loading is enabled (disable it in production for performance and deployment
consistency reasons)
[13:06:47,659][WARN ][main][GridCollisionManager] Collision resolution is
disabled (all jobs will be activated upon arrival).
[13:06:47,660][WARN ][main][NoopSwapSpaceSpi] Swap space is disabled. To enable
use FileSwapSpaceSpi.
[13:06:48,966][ERROR][main][root] Test failed.
java.lang.AssertionError: Invalid event [evtType=45, expectedType=41,
evts=[TaskEvent
[taskName=org.apache.ignite.internal.GridEventStorageCheckAllEventsSelfTest$GridAllEventsTestTask,
taskClsName=org.apache.ignite.internal.GridEventStorageCheckAllEventsSelfTest$GridAllEventsTestTask,
sesId=e53ddf95251-af0890dd-f87e-4dca-8b22-bab1b6a13404, internal=false,
subjId=af0890dd-f87e-4dca-8b22-bab1b6a13404, nodeId8=af0890dd, msg=Task
started., type=TASK_STARTED, tstamp=1453208808959], JobEvent
[taskName=org.apache.ignite.internal.GridEventStorageCheckAllEventsSelfTest$GridAllEventsTestTask,
taskClsName=org.apache.ignite.internal.GridEventStorageCheckAllEventsSelfTest$GridAllEventsTestTask,
sesId=e53ddf95251-af0890dd-f87e-4dca-8b22-bab1b6a13404,
jobId=063ddf95251-af0890dd-f87e-4dca-8b22-bab1b6a13404,
taskNode=TcpDiscoveryNode [id=af0890dd-f87e-4dca-8b22-bab1b6a13404,
addrs=[127.0.0.1], sockAddrs=[/127.0.0.1:47500], discPort=47500, order=1,
intOrder=1, lastExchangeTime=1453208807679, loc=true,
ver=1.5.1#20160119-sha1:09c1d5e4, isClient=false],
taskSubjId=af0890dd-f87e-4dca-8b22-bab1b6a13404, nodeId8=af0890dd, msg=Job got
mapped., type=JOB_MAPPED, tstamp=1453208808959], JobEvent
[taskName=org.apache.ignite.internal.GridEventStorageCheckAllEventsSelfTest$GridAllEventsTestTask,
taskClsName=org.apache.ignite.internal.GridEventStorageCheckAllEventsSelfTest$GridAllEventsTestTask,
sesId=e53ddf95251-af0890dd-f87e-4dca-8b22-bab1b6a13404,
jobId=063ddf95251-af0890dd-f87e-4dca-8b22-bab1b6a13404,
taskNode=TcpDiscoveryNode [id=af0890dd-f87e-4dca-8b22-bab1b6a13404,
addrs=[127.0.0.1], sockAddrs=[/127.0.0.1:47500], discPort=47500, order=1,
intOrder=1, lastExchangeTime=1453208807679, loc=true,
ver=1.5.1#20160119-sha1:09c1d5e4, isClient=false],
taskSubjId=af0890dd-f87e-4dca-8b22-bab1b6a13404, nodeId8=af0890dd, msg=Job got
queued for computation., type=JOB_QUEUED, tstamp=1453208808959], JobEvent
[taskName=org.apache.ignite.internal.GridEventStorageCheckAllEventsSelfTest$GridAllEventsTestTask,
taskClsName=org.apache.ignite.internal.GridEventStorageCheckAllEventsSelfTest$GridAllEventsTestTask,
sesId=e53ddf95251-af0890dd-f87e-4dca-8b22-bab1b6a13404,
jobId=063ddf95251-af0890dd-f87e-4dca-8b22-bab1b6a13404,
taskNode=TcpDiscoveryNode [id=af0890dd-f87e-4dca-8b22-bab1b6a13404,
addrs=[127.0.0.1], sockAddrs=[/127.0.0.1:47500], discPort=47500, order=1,
intOrder=1, lastExchangeTime=1453208807679, loc=true,
ver=1.5.1#20160119-sha1:09c1d5e4, isClient=false],
taskSubjId=af0890dd-f87e-4dca-8b22-bab1b6a13404, nodeId8=af0890dd, msg=null,
type=JOB_STARTED, tstamp=1453208808959], CheckpointEvent [cpKey=testCheckpoint,
nodeId8=af0890dd, msg=Checkpoint saved: testCheckpoint, type=CHECKPOINT_SAVED,
tstamp=1453208808959], CheckpointEvent [cpKey=testCheckpoint, nodeId8=af0890dd,
msg=Checkpoint removed: testCheckpoint, type=CHECKPOINT_REMOVED,
tstamp=1453208808959], JobEvent
[taskName=org.apache.ignite.internal.GridEventStorageCheckAllEventsSelfTest$GridAllEventsTestTask,
taskClsName=org.apache.ignite.internal.GridEventStorageCheckAllEventsSelfTest$GridAllEventsTestTask,
sesId=e53ddf95251-af0890dd-f87e-4dca-8b22-bab1b6a13404,
jobId=063ddf95251-af0890dd-f87e-4dca-8b22-bab1b6a13404,
taskNode=TcpDiscoveryNode [id=af0890dd-f87e-4dca-8b22-bab1b6a13404,
addrs=[127.0.0.1], sockAddrs=[/127.0.0.1:47500], discPort=47500, order=1,
intOrder=1, lastExchangeTime=1453208807679, loc=true,
ver=1.5.1#20160119-sha1:09c1d5e4, isClient=false],
taskSubjId=af0890dd-f87e-4dca-8b22-bab1b6a13404, nodeId8=af0890dd, msg=null,
type=JOB_FINISHED, tstamp=1453208808959], JobEvent
[taskName=org.apache.ignite.internal.GridEventStorageCheckAllEventsSelfTest$GridAllEventsTestTask,
taskClsName=org.apache.ignite.internal.GridEventStorageCheckAllEventsSelfTest$GridAllEventsTestTask,
sesId=e53ddf95251-af0890dd-f87e-4dca-8b22-bab1b6a13404,
jobId=063ddf95251-af0890dd-f87e-4dca-8b22-bab1b6a13404,
taskNode=TcpDiscoveryNode [id=af0890dd-f87e-4dca-8b22-bab1b6a13404,
addrs=[127.0.0.1], sockAddrs=[/127.0.0.1:47500], discPort=47500, order=1,
intOrder=1, lastExchangeTime=1453208807679, loc=true,
ver=1.5.1#20160119-sha1:09c1d5e4, isClient=false],
taskSubjId=af0890dd-f87e-4dca-8b22-bab1b6a13404, nodeId8=af0890dd, msg=Job got
resulted with: WAIT, type=JOB_RESULTED, tstamp=1453208808959], TaskEvent
[taskName=org.apache.ignite.internal.GridEventStorageCheckAllEventsSelfTest$GridAllEventsTestTask,
taskClsName=org.apache.ignite.internal.GridEventStorageCheckAllEventsSelfTest$GridAllEventsTestTask,
sesId=e53ddf95251-af0890dd-f87e-4dca-8b22-bab1b6a13404, internal=false,
subjId=af0890dd-f87e-4dca-8b22-bab1b6a13404, nodeId8=af0890dd, msg=Task
reduced., type=TASK_REDUCED, tstamp=1453208808959], TaskEvent
[taskName=org.apache.ignite.internal.GridEventStorageCheckAllEventsSelfTest$GridAllEventsTestTask,
taskClsName=org.apache.ignite.internal.GridEventStorageCheckAllEventsSelfTest$GridAllEventsTestTask,
sesId=e53ddf95251-af0890dd-f87e-4dca-8b22-bab1b6a13404, internal=false,
subjId=af0890dd-f87e-4dca-8b22-bab1b6a13404, nodeId8=af0890dd, msg=Task
finished., type=TASK_FINISHED, tstamp=1453208808959]]]
at
org.apache.ignite.internal.GridEventStorageCheckAllEventsSelfTest.assertEvent(GridEventStorageCheckAllEventsSelfTest.java:112)
at
org.apache.ignite.internal.GridEventStorageCheckAllEventsSelfTest.testSuccessTask(GridEventStorageCheckAllEventsSelfTest.java:184)
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
org.apache.ignite.testframework.junits.GridAbstractTest.runTestInternal(GridAbstractTest.java:1699)
at
org.apache.ignite.testframework.junits.GridAbstractTest.access$000(GridAbstractTest.java:116)
at
org.apache.ignite.testframework.junits.GridAbstractTest$4.run(GridAbstractTest.java:1637)
at java.lang.Thread.run(Thread.java:745)
{noformat}
Summary: [Test] [Rare]
GridEventStorageCheckAllEventsSelfTest.testSuccessTask AND
GridEventStorageCheckAllEventsSelfTest.testFailTask (was: [Test] [Rare]
GridEventStorageCheckAllEventsSelfTest.testSuccessTask)
> [Test] [Rare] GridEventStorageCheckAllEventsSelfTest.testSuccessTask AND
> GridEventStorageCheckAllEventsSelfTest.testFailTask
> ----------------------------------------------------------------------------------------------------------------------------
>
> Key: IGNITE-2406
> URL: https://issues.apache.org/jira/browse/IGNITE-2406
> Project: Ignite
> Issue Type: Bug
> Reporter: Vladimir Ershov
> Priority: Minor
>
> Rare fail of GridEventStorageCheckAllEventsSelfTest testSuccessTask
> log:
> {noformat}
> ------- Stderr: -------
> [13:06:47,647][WARN ][main][GridEventStorageCheckAllEventsSelfTest] Peer
> class loading is enabled (disable it in production for performance and
> deployment consistency reasons)
> [13:06:47,659][WARN ][main][GridCollisionManager] Collision resolution is
> disabled (all jobs will be activated upon arrival).
> [13:06:47,660][WARN ][main][NoopSwapSpaceSpi] Swap space is disabled. To
> enable use FileSwapSpaceSpi.
> [13:06:48,966][ERROR][main][root] Test failed.
> java.lang.AssertionError: Invalid event [evtType=45, expectedType=41,
> evts=[TaskEvent
> [taskName=org.apache.ignite.internal.GridEventStorageCheckAllEventsSelfTest$GridAllEventsTestTask,
>
> taskClsName=org.apache.ignite.internal.GridEventStorageCheckAllEventsSelfTest$GridAllEventsTestTask,
> sesId=e53ddf95251-af0890dd-f87e-4dca-8b22-bab1b6a13404, internal=false,
> subjId=af0890dd-f87e-4dca-8b22-bab1b6a13404, nodeId8=af0890dd, msg=Task
> started., type=TASK_STARTED, tstamp=1453208808959], JobEvent
> [taskName=org.apache.ignite.internal.GridEventStorageCheckAllEventsSelfTest$GridAllEventsTestTask,
>
> taskClsName=org.apache.ignite.internal.GridEventStorageCheckAllEventsSelfTest$GridAllEventsTestTask,
> sesId=e53ddf95251-af0890dd-f87e-4dca-8b22-bab1b6a13404,
> jobId=063ddf95251-af0890dd-f87e-4dca-8b22-bab1b6a13404,
> taskNode=TcpDiscoveryNode [id=af0890dd-f87e-4dca-8b22-bab1b6a13404,
> addrs=[127.0.0.1], sockAddrs=[/127.0.0.1:47500], discPort=47500, order=1,
> intOrder=1, lastExchangeTime=1453208807679, loc=true,
> ver=1.5.1#20160119-sha1:09c1d5e4, isClient=false],
> taskSubjId=af0890dd-f87e-4dca-8b22-bab1b6a13404, nodeId8=af0890dd, msg=Job
> got mapped., type=JOB_MAPPED, tstamp=1453208808959], JobEvent
> [taskName=org.apache.ignite.internal.GridEventStorageCheckAllEventsSelfTest$GridAllEventsTestTask,
>
> taskClsName=org.apache.ignite.internal.GridEventStorageCheckAllEventsSelfTest$GridAllEventsTestTask,
> sesId=e53ddf95251-af0890dd-f87e-4dca-8b22-bab1b6a13404,
> jobId=063ddf95251-af0890dd-f87e-4dca-8b22-bab1b6a13404,
> taskNode=TcpDiscoveryNode [id=af0890dd-f87e-4dca-8b22-bab1b6a13404,
> addrs=[127.0.0.1], sockAddrs=[/127.0.0.1:47500], discPort=47500, order=1,
> intOrder=1, lastExchangeTime=1453208807679, loc=true,
> ver=1.5.1#20160119-sha1:09c1d5e4, isClient=false],
> taskSubjId=af0890dd-f87e-4dca-8b22-bab1b6a13404, nodeId8=af0890dd, msg=Job
> got queued for computation., type=JOB_QUEUED, tstamp=1453208808959], JobEvent
> [taskName=org.apache.ignite.internal.GridEventStorageCheckAllEventsSelfTest$GridAllEventsTestTask,
>
> taskClsName=org.apache.ignite.internal.GridEventStorageCheckAllEventsSelfTest$GridAllEventsTestTask,
> sesId=e53ddf95251-af0890dd-f87e-4dca-8b22-bab1b6a13404,
> jobId=063ddf95251-af0890dd-f87e-4dca-8b22-bab1b6a13404,
> taskNode=TcpDiscoveryNode [id=af0890dd-f87e-4dca-8b22-bab1b6a13404,
> addrs=[127.0.0.1], sockAddrs=[/127.0.0.1:47500], discPort=47500, order=1,
> intOrder=1, lastExchangeTime=1453208807679, loc=true,
> ver=1.5.1#20160119-sha1:09c1d5e4, isClient=false],
> taskSubjId=af0890dd-f87e-4dca-8b22-bab1b6a13404, nodeId8=af0890dd, msg=null,
> type=JOB_STARTED, tstamp=1453208808959], CheckpointEvent
> [cpKey=testCheckpoint, nodeId8=af0890dd, msg=Checkpoint saved:
> testCheckpoint, type=CHECKPOINT_SAVED, tstamp=1453208808959], CheckpointEvent
> [cpKey=testCheckpoint, nodeId8=af0890dd, msg=Checkpoint removed:
> testCheckpoint, type=CHECKPOINT_REMOVED, tstamp=1453208808959], JobEvent
> [taskName=org.apache.ignite.internal.GridEventStorageCheckAllEventsSelfTest$GridAllEventsTestTask,
>
> taskClsName=org.apache.ignite.internal.GridEventStorageCheckAllEventsSelfTest$GridAllEventsTestTask,
> sesId=e53ddf95251-af0890dd-f87e-4dca-8b22-bab1b6a13404,
> jobId=063ddf95251-af0890dd-f87e-4dca-8b22-bab1b6a13404,
> taskNode=TcpDiscoveryNode [id=af0890dd-f87e-4dca-8b22-bab1b6a13404,
> addrs=[127.0.0.1], sockAddrs=[/127.0.0.1:47500], discPort=47500, order=1,
> intOrder=1, lastExchangeTime=1453208807679, loc=true,
> ver=1.5.1#20160119-sha1:09c1d5e4, isClient=false],
> taskSubjId=af0890dd-f87e-4dca-8b22-bab1b6a13404, nodeId8=af0890dd, msg=null,
> type=JOB_FINISHED, tstamp=1453208808959], JobEvent
> [taskName=org.apache.ignite.internal.GridEventStorageCheckAllEventsSelfTest$GridAllEventsTestTask,
>
> taskClsName=org.apache.ignite.internal.GridEventStorageCheckAllEventsSelfTest$GridAllEventsTestTask,
> sesId=e53ddf95251-af0890dd-f87e-4dca-8b22-bab1b6a13404,
> jobId=063ddf95251-af0890dd-f87e-4dca-8b22-bab1b6a13404,
> taskNode=TcpDiscoveryNode [id=af0890dd-f87e-4dca-8b22-bab1b6a13404,
> addrs=[127.0.0.1], sockAddrs=[/127.0.0.1:47500], discPort=47500, order=1,
> intOrder=1, lastExchangeTime=1453208807679, loc=true,
> ver=1.5.1#20160119-sha1:09c1d5e4, isClient=false],
> taskSubjId=af0890dd-f87e-4dca-8b22-bab1b6a13404, nodeId8=af0890dd, msg=Job
> got resulted with: WAIT, type=JOB_RESULTED, tstamp=1453208808959], TaskEvent
> [taskName=org.apache.ignite.internal.GridEventStorageCheckAllEventsSelfTest$GridAllEventsTestTask,
>
> taskClsName=org.apache.ignite.internal.GridEventStorageCheckAllEventsSelfTest$GridAllEventsTestTask,
> sesId=e53ddf95251-af0890dd-f87e-4dca-8b22-bab1b6a13404, internal=false,
> subjId=af0890dd-f87e-4dca-8b22-bab1b6a13404, nodeId8=af0890dd, msg=Task
> reduced., type=TASK_REDUCED, tstamp=1453208808959], TaskEvent
> [taskName=org.apache.ignite.internal.GridEventStorageCheckAllEventsSelfTest$GridAllEventsTestTask,
>
> taskClsName=org.apache.ignite.internal.GridEventStorageCheckAllEventsSelfTest$GridAllEventsTestTask,
> sesId=e53ddf95251-af0890dd-f87e-4dca-8b22-bab1b6a13404, internal=false,
> subjId=af0890dd-f87e-4dca-8b22-bab1b6a13404, nodeId8=af0890dd, msg=Task
> finished., type=TASK_FINISHED, tstamp=1453208808959]]]
> at
> org.apache.ignite.internal.GridEventStorageCheckAllEventsSelfTest.assertEvent(GridEventStorageCheckAllEventsSelfTest.java:112)
> at
> org.apache.ignite.internal.GridEventStorageCheckAllEventsSelfTest.testSuccessTask(GridEventStorageCheckAllEventsSelfTest.java:184)
> 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
> org.apache.ignite.testframework.junits.GridAbstractTest.runTestInternal(GridAbstractTest.java:1699)
> at
> org.apache.ignite.testframework.junits.GridAbstractTest.access$000(GridAbstractTest.java:116)
> at
> org.apache.ignite.testframework.junits.GridAbstractTest$4.run(GridAbstractTest.java:1637)
> at java.lang.Thread.run(Thread.java:745)
> {noformat}
> Rare fail of GridEventStorageCheckAllEventsSelfTest.testFailTask
> {noformat}
> ------- Stderr: -------
> [19:40:28,931][ERROR][pub-#13981%internal.GridEventStorageCheckAllEventsSelfTest%][GridJobWorker]
> Failed to execute job due to unexpected runtime exception
> [jobId=de5bf365251-df9117ef-9ddb-46c4-9ef4-16c32d349f6e,
> ses=GridJobSessionImpl [ses=GridTaskSessionImpl
> [taskName=o.a.i.i.GridEventStorageCheckAllEventsSelfTest$GridAllEventsTestTask,
> dep=GridDeployment [ts=1453146028896, depMode=SHARED,
> clsLdr=IsolatedClassLoader{roleName='test'},
> clsLdrId=9e5bf365251-df9117ef-9ddb-46c4-9ef4-16c32d349f6e, userVer=0,
> loc=true,
> sampleClsName=o.a.i.i.GridEventStorageCheckAllEventsSelfTest$GridAllEventsTestTask,
> pendingUndeploy=false, undeployed=false, usage=2],
> taskClsName=o.a.i.i.GridEventStorageCheckAllEventsSelfTest$GridAllEventsTestTask,
> sesId=be5bf365251-df9117ef-9ddb-46c4-9ef4-16c32d349f6e,
> startTime=1453146028927, endTime=9223372036854775807,
> taskNodeId=df9117ef-9ddb-46c4-9ef4-16c32d349f6e,
> clsLdr=IsolatedClassLoader{roleName='test'}, closed=false, cpSpi=null,
> failSpi=null, loadSpi=null, usage=2, fullSup=true,
> subjId=df9117ef-9ddb-46c4-9ef4-16c32d349f6e, mapFut=IgniteFuture
> [orig=GridFutureAdapter [resFlag=2, res=null, startTime=1453146028927,
> endTime=1453146028927, ignoreInterrupts=false, lsnr=null, state=DONE]]],
> jobId=de5bf365251-df9117ef-9ddb-46c4-9ef4-16c32d349f6e]]
> java.lang.RuntimeException: GridAllEventsFailTestJob expected test exception.
> at
> org.apache.ignite.internal.GridEventStorageCheckAllEventsSelfTest$GridAllEventsFailTestJob.execute(GridEventStorageCheckAllEventsSelfTest.java:413)
> at
> org.apache.ignite.internal.GridEventStorageCheckAllEventsSelfTest$GridAllEventsFailTestJob.execute(GridEventStorageCheckAllEventsSelfTest.java:410)
> at
> org.apache.ignite.internal.processors.job.GridJobWorker$2.call(GridJobWorker.java:509)
> at
> org.apache.ignite.internal.util.IgniteUtils.wrapThreadLoader(IgniteUtils.java:6407)
> at
> org.apache.ignite.internal.processors.job.GridJobWorker.execute0(GridJobWorker.java:503)
> at
> org.apache.ignite.internal.processors.job.GridJobWorker.body(GridJobWorker.java:456)
> at
> org.apache.ignite.internal.util.worker.GridWorker.run(GridWorker.java:110)
> 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)
> [19:40:28,933][ERROR][test-runner-#14053%internal.GridEventStorageCheckAllEventsSelfTest%][GridTaskWorker]
> Failed to obtain remote job result policy for result from
> ComputeTask.result(..) method (will fail the whole task): GridJobResultImpl
> [job=o.a.i.i.GridEventStorageCheckAllEventsSelfTest$GridAllEventsFailTestJob@16f212b0,
> sib=GridJobSiblingImpl
> [sesId=be5bf365251-df9117ef-9ddb-46c4-9ef4-16c32d349f6e,
> jobId=de5bf365251-df9117ef-9ddb-46c4-9ef4-16c32d349f6e,
> nodeId=df9117ef-9ddb-46c4-9ef4-16c32d349f6e, isJobDone=false],
> jobCtx=GridJobContextImpl
> [jobId=de5bf365251-df9117ef-9ddb-46c4-9ef4-16c32d349f6e, timeoutObj=null,
> attrs={}], node=TcpDiscoveryNode [id=df9117ef-9ddb-46c4-9ef4-16c32d349f6e,
> addrs=[127.0.0.1], sockAddrs=[/127.0.0.1:47500], discPort=47500, order=1,
> intOrder=1, lastExchangeTime=1453146027467, loc=true,
> ver=1.5.1#20160118-sha1:67791457, isClient=false], ex=class
> o.a.i.compute.ComputeUserUndeclaredException: Failed to execute job due to
> unexpected runtime exception
> [jobId=de5bf365251-df9117ef-9ddb-46c4-9ef4-16c32d349f6e,
> ses=GridJobSessionImpl [ses=GridTaskSessionImpl
> [taskName=o.a.i.i.GridEventStorageCheckAllEventsSelfTest$GridAllEventsTestTask,
> dep=GridDeployment [ts=1453146028896, depMode=SHARED,
> clsLdr=IsolatedClassLoader{roleName='test'},
> clsLdrId=9e5bf365251-df9117ef-9ddb-46c4-9ef4-16c32d349f6e, userVer=0,
> loc=true,
> sampleClsName=o.a.i.i.GridEventStorageCheckAllEventsSelfTest$GridAllEventsTestTask,
> pendingUndeploy=false, undeployed=false, usage=2],
> taskClsName=o.a.i.i.GridEventStorageCheckAllEventsSelfTest$GridAllEventsTestTask,
> sesId=be5bf365251-df9117ef-9ddb-46c4-9ef4-16c32d349f6e,
> startTime=1453146028927, endTime=9223372036854775807,
> taskNodeId=df9117ef-9ddb-46c4-9ef4-16c32d349f6e,
> clsLdr=IsolatedClassLoader{roleName='test'}, closed=false, cpSpi=null,
> failSpi=null, loadSpi=null, usage=2, fullSup=true,
> subjId=df9117ef-9ddb-46c4-9ef4-16c32d349f6e, mapFut=IgniteFuture
> [orig=GridFutureAdapter [resFlag=2, res=null, startTime=1453146028927,
> endTime=1453146028927, ignoreInterrupts=false, lsnr=null, state=DONE]]],
> jobId=de5bf365251-df9117ef-9ddb-46c4-9ef4-16c32d349f6e]], hasRes=true,
> isCancelled=false, isOccupied=true]
> class org.apache.ignite.IgniteException: Remote job threw user exception
> (override or implement ComputeTask.result(..) method if you would like to
> have automatic failover for this exception).
> at
> org.apache.ignite.compute.ComputeTaskAdapter.result(ComputeTaskAdapter.java:101)
> at
> org.apache.ignite.internal.processors.task.GridTaskWorker$3.apply(GridTaskWorker.java:909)
> at
> org.apache.ignite.internal.processors.task.GridTaskWorker$3.apply(GridTaskWorker.java:902)
> at
> org.apache.ignite.internal.util.IgniteUtils.wrapThreadLoader(IgniteUtils.java:6439)
> at
> org.apache.ignite.internal.processors.task.GridTaskWorker.result(GridTaskWorker.java:902)
> at
> org.apache.ignite.internal.processors.task.GridTaskWorker.onResponse(GridTaskWorker.java:798)
> at
> org.apache.ignite.internal.processors.task.GridTaskWorker.processDelayedResponses(GridTaskWorker.java:656)
> at
> org.apache.ignite.internal.processors.task.GridTaskWorker.body(GridTaskWorker.java:507)
> at
> org.apache.ignite.internal.util.worker.GridWorker.run(GridWorker.java:110)
> at
> org.apache.ignite.internal.processors.task.GridTaskProcessor.startTask(GridTaskProcessor.java:678)
> at
> org.apache.ignite.internal.processors.task.GridTaskProcessor.execute(GridTaskProcessor.java:447)
> at
> org.apache.ignite.internal.IgniteComputeImpl.execute(IgniteComputeImpl.java:151)
> at
> org.apache.ignite.internal.GridEventStorageCheckAllEventsSelfTest.generateEvents(GridEventStorageCheckAllEventsSelfTest.java:342)
> at
> org.apache.ignite.internal.GridEventStorageCheckAllEventsSelfTest.testFailTask(GridEventStorageCheckAllEventsSelfTest.java:196)
> 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
> org.apache.ignite.testframework.junits.GridAbstractTest.runTestInternal(GridAbstractTest.java:1699)
> at
> org.apache.ignite.testframework.junits.GridAbstractTest.access$000(GridAbstractTest.java:116)
> at
> org.apache.ignite.testframework.junits.GridAbstractTest$4.run(GridAbstractTest.java:1637)
> at java.lang.Thread.run(Thread.java:745)
> Caused by: class org.apache.ignite.compute.ComputeUserUndeclaredException:
> Failed to execute job due to unexpected runtime exception
> [jobId=de5bf365251-df9117ef-9ddb-46c4-9ef4-16c32d349f6e,
> ses=GridJobSessionImpl [ses=GridTaskSessionImpl
> [taskName=org.apache.ignite.internal.GridEventStorageCheckAllEventsSelfTest$GridAllEventsTestTask,
> dep=GridDeployment [ts=1453146028896, depMode=SHARED,
> clsLdr=IsolatedClassLoader{roleName='test'},
> clsLdrId=9e5bf365251-df9117ef-9ddb-46c4-9ef4-16c32d349f6e, userVer=0,
> loc=true,
> sampleClsName=org.apache.ignite.internal.GridEventStorageCheckAllEventsSelfTest$GridAllEventsTestTask,
> pendingUndeploy=false, undeployed=false, usage=2],
> taskClsName=org.apache.ignite.internal.GridEventStorageCheckAllEventsSelfTest$GridAllEventsTestTask,
> sesId=be5bf365251-df9117ef-9ddb-46c4-9ef4-16c32d349f6e,
> startTime=1453146028927, endTime=9223372036854775807,
> taskNodeId=df9117ef-9ddb-46c4-9ef4-16c32d349f6e,
> clsLdr=IsolatedClassLoader{roleName='test'}, closed=false, cpSpi=null,
> failSpi=null, loadSpi=null, usage=2, fullSup=true,
> subjId=df9117ef-9ddb-46c4-9ef4-16c32d349f6e, mapFut=IgniteFuture
> [orig=GridFutureAdapter [resFlag=2, res=null, startTime=1453146028927,
> endTime=1453146028927, ignoreInterrupts=false, lsnr=null, state=DONE]]],
> jobId=de5bf365251-df9117ef-9ddb-46c4-9ef4-16c32d349f6e]]
> at
> org.apache.ignite.internal.processors.job.GridJobWorker.handleThrowable(GridJobWorker.java:607)
> at
> org.apache.ignite.internal.processors.job.GridJobWorker.execute0(GridJobWorker.java:551)
> at
> org.apache.ignite.internal.processors.job.GridJobWorker.body(GridJobWorker.java:456)
> at
> org.apache.ignite.internal.util.worker.GridWorker.run(GridWorker.java:110)
> at
> java.util.concurrent.ThreadPoolExecutor.runWorker(ThreadPoolExecutor.java:1145)
> at
> java.util.concurrent.ThreadPoolExecutor$Worker.run(ThreadPoolExecutor.java:615)
> ... 1 more
> Caused by: java.lang.RuntimeException: GridAllEventsFailTestJob expected test
> exception.
> at
> org.apache.ignite.internal.GridEventStorageCheckAllEventsSelfTest$GridAllEventsFailTestJob.execute(GridEventStorageCheckAllEventsSelfTest.java:413)
> at
> org.apache.ignite.internal.GridEventStorageCheckAllEventsSelfTest$GridAllEventsFailTestJob.execute(GridEventStorageCheckAllEventsSelfTest.java:410)
> at
> org.apache.ignite.internal.processors.job.GridJobWorker$2.call(GridJobWorker.java:509)
> at
> org.apache.ignite.internal.util.IgniteUtils.wrapThreadLoader(IgniteUtils.java:6407)
> at
> org.apache.ignite.internal.processors.job.GridJobWorker.execute0(GridJobWorker.java:503)
> ... 5 more
> [19:40:28,943][ERROR][main][root] Test failed.
> java.lang.AssertionError: Invalid event [evtType=48, expectedType=41,
> evts=[TaskEvent
> [taskName=org.apache.ignite.internal.GridEventStorageCheckAllEventsSelfTest$GridAllEventsTestTask,
>
> taskClsName=org.apache.ignite.internal.GridEventStorageCheckAllEventsSelfTest$GridAllEventsTestTask,
> sesId=be5bf365251-df9117ef-9ddb-46c4-9ef4-16c32d349f6e, internal=false,
> subjId=df9117ef-9ddb-46c4-9ef4-16c32d349f6e, nodeId8=df9117ef, msg=Task
> started., type=TASK_STARTED, tstamp=1453146028927], JobEvent
> [taskName=org.apache.ignite.internal.GridEventStorageCheckAllEventsSelfTest$GridAllEventsTestTask,
>
> taskClsName=org.apache.ignite.internal.GridEventStorageCheckAllEventsSelfTest$GridAllEventsTestTask,
> sesId=be5bf365251-df9117ef-9ddb-46c4-9ef4-16c32d349f6e,
> jobId=de5bf365251-df9117ef-9ddb-46c4-9ef4-16c32d349f6e,
> taskNode=TcpDiscoveryNode [id=df9117ef-9ddb-46c4-9ef4-16c32d349f6e,
> addrs=[127.0.0.1], sockAddrs=[/127.0.0.1:47500], discPort=47500, order=1,
> intOrder=1, lastExchangeTime=1453146027467, loc=true,
> ver=1.5.1#20160118-sha1:67791457, isClient=false],
> taskSubjId=df9117ef-9ddb-46c4-9ef4-16c32d349f6e, nodeId8=df9117ef, msg=Job
> got mapped., type=JOB_MAPPED, tstamp=1453146028927], JobEvent
> [taskName=org.apache.ignite.internal.GridEventStorageCheckAllEventsSelfTest$GridAllEventsTestTask,
>
> taskClsName=org.apache.ignite.internal.GridEventStorageCheckAllEventsSelfTest$GridAllEventsTestTask,
> sesId=be5bf365251-df9117ef-9ddb-46c4-9ef4-16c32d349f6e,
> jobId=de5bf365251-df9117ef-9ddb-46c4-9ef4-16c32d349f6e,
> taskNode=TcpDiscoveryNode [id=df9117ef-9ddb-46c4-9ef4-16c32d349f6e,
> addrs=[127.0.0.1], sockAddrs=[/127.0.0.1:47500], discPort=47500, order=1,
> intOrder=1, lastExchangeTime=1453146027467, loc=true,
> ver=1.5.1#20160118-sha1:67791457, isClient=false],
> taskSubjId=df9117ef-9ddb-46c4-9ef4-16c32d349f6e, nodeId8=df9117ef, msg=Job
> got queued for computation., type=JOB_QUEUED, tstamp=1453146028927], JobEvent
> [taskName=org.apache.ignite.internal.GridEventStorageCheckAllEventsSelfTest$GridAllEventsTestTask,
>
> taskClsName=org.apache.ignite.internal.GridEventStorageCheckAllEventsSelfTest$GridAllEventsTestTask,
> sesId=be5bf365251-df9117ef-9ddb-46c4-9ef4-16c32d349f6e,
> jobId=de5bf365251-df9117ef-9ddb-46c4-9ef4-16c32d349f6e,
> taskNode=TcpDiscoveryNode [id=df9117ef-9ddb-46c4-9ef4-16c32d349f6e,
> addrs=[127.0.0.1], sockAddrs=[/127.0.0.1:47500], discPort=47500, order=1,
> intOrder=1, lastExchangeTime=1453146027467, loc=true,
> ver=1.5.1#20160118-sha1:67791457, isClient=false],
> taskSubjId=df9117ef-9ddb-46c4-9ef4-16c32d349f6e, nodeId8=df9117ef, msg=null,
> type=JOB_STARTED, tstamp=1453146028927], JobEvent
> [taskName=org.apache.ignite.internal.GridEventStorageCheckAllEventsSelfTest$GridAllEventsTestTask,
>
> taskClsName=org.apache.ignite.internal.GridEventStorageCheckAllEventsSelfTest$GridAllEventsTestTask,
> sesId=be5bf365251-df9117ef-9ddb-46c4-9ef4-16c32d349f6e,
> jobId=de5bf365251-df9117ef-9ddb-46c4-9ef4-16c32d349f6e,
> taskNode=TcpDiscoveryNode [id=df9117ef-9ddb-46c4-9ef4-16c32d349f6e,
> addrs=[127.0.0.1], sockAddrs=[/127.0.0.1:47500], discPort=47500, order=1,
> intOrder=1, lastExchangeTime=1453146027467, loc=true,
> ver=1.5.1#20160118-sha1:67791457, isClient=false],
> taskSubjId=df9117ef-9ddb-46c4-9ef4-16c32d349f6e, nodeId8=df9117ef, msg=Job
> failed due to exception [ex=class
> org.apache.ignite.compute.ComputeUserUndeclaredException: Failed to execute
> job due to unexpected runtime exception
> [jobId=de5bf365251-df9117ef-9ddb-46c4-9ef4-16c32d349f6e,
> ses=GridJobSessionImpl [ses=GridTaskSessionImpl
> [taskName=org.apache.ignite.internal.GridEventStorageCheckAllEventsSelfTest$GridAllEventsTestTask,
> dep=GridDeployment [ts=1453146028896, depMode=SHARED,
> clsLdr=IsolatedClassLoader{roleName='test'},
> clsLdrId=9e5bf365251-df9117ef-9ddb-46c4-9ef4-16c32d349f6e, userVer=0,
> loc=true,
> sampleClsName=org.apache.ignite.internal.GridEventStorageCheckAllEventsSelfTest$GridAllEventsTestTask,
> pendingUndeploy=false, undeployed=false, usage=2],
> taskClsName=org.apache.ignite.internal.GridEventStorageCheckAllEventsSelfTest$GridAllEventsTestTask,
> sesId=be5bf365251-df9117ef-9ddb-46c4-9ef4-16c32d349f6e,
> startTime=1453146028927, endTime=9223372036854775807,
> taskNodeId=df9117ef-9ddb-46c4-9ef4-16c32d349f6e,
> clsLdr=IsolatedClassLoader{roleName='test'}, closed=false, cpSpi=null,
> failSpi=null, loadSpi=null, usage=2, fullSup=true,
> subjId=df9117ef-9ddb-46c4-9ef4-16c32d349f6e, mapFut=IgniteFuture
> [orig=GridFutureAdapter [resFlag=2, res=null, startTime=1453146028927,
> endTime=1453146028927, ignoreInterrupts=false, lsnr=null, state=DONE]]],
> jobId=de5bf365251-df9117ef-9ddb-46c4-9ef4-16c32d349f6e]],
> job=org.apache.ignite.internal.GridEventStorageCheckAllEventsSelfTest$GridAllEventsFailTestJob@16f212b0],
> type=JOB_FAILED, tstamp=1453146028927], JobEvent
> [taskName=org.apache.ignite.internal.GridEventStorageCheckAllEventsSelfTest$GridAllEventsTestTask,
>
> taskClsName=org.apache.ignite.internal.GridEventStorageCheckAllEventsSelfTest$GridAllEventsTestTask,
> sesId=be5bf365251-df9117ef-9ddb-46c4-9ef4-16c32d349f6e,
> jobId=de5bf365251-df9117ef-9ddb-46c4-9ef4-16c32d349f6e,
> taskNode=TcpDiscoveryNode [id=df9117ef-9ddb-46c4-9ef4-16c32d349f6e,
> addrs=[127.0.0.1], sockAddrs=[/127.0.0.1:47500], discPort=47500, order=1,
> intOrder=1, lastExchangeTime=1453146027467, loc=true,
> ver=1.5.1#20160118-sha1:67791457, isClient=false],
> taskSubjId=df9117ef-9ddb-46c4-9ef4-16c32d349f6e, nodeId8=df9117ef, msg=Job
> got resulted with: null, type=JOB_RESULTED, tstamp=1453146028927], TaskEvent
> [taskName=org.apache.ignite.internal.GridEventStorageCheckAllEventsSelfTest$GridAllEventsTestTask,
>
> taskClsName=org.apache.ignite.internal.GridEventStorageCheckAllEventsSelfTest$GridAllEventsTestTask,
> sesId=be5bf365251-df9117ef-9ddb-46c4-9ef4-16c32d349f6e, internal=false,
> subjId=df9117ef-9ddb-46c4-9ef4-16c32d349f6e, nodeId8=df9117ef, msg=Task
> failed., type=TASK_FAILED, tstamp=1453146028927]]]
> at
> org.apache.ignite.internal.GridEventStorageCheckAllEventsSelfTest.assertEvent(GridEventStorageCheckAllEventsSelfTest.java:112)
> at
> org.apache.ignite.internal.GridEventStorageCheckAllEventsSelfTest.testFailTask(GridEventStorageCheckAllEventsSelfTest.java:213)
> 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
> org.apache.ignite.testframework.junits.GridAbstractTest.runTestInternal(GridAbstractTest.java:1699)
> at
> org.apache.ignite.testframework.junits.GridAbstractTest.access$000(GridAbstractTest.java:116)
> at
> org.apache.ignite.testframework.junits.GridAbstractTest$4.run(GridAbstractTest.java:1637)
> at java.lang.Thread.run(Thread.java:745)
> {noformat}
--
This message was sent by Atlassian JIRA
(v6.3.4#6332)
