[
https://issues.apache.org/jira/browse/IGNITE-633?page=com.atlassian.jira.plugin.system.issuetabpanels:all-tabpanel
]
Vladimir Ozerov updated IGNITE-633:
-----------------------------------
Fix Version/s: (was: sprint-5)
sprint-6
> Test HadoopMapReduceEmbeddedSelfTest.testWholeMapReduceExecution sometimes
> hangs
> --------------------------------------------------------------------------------
>
> Key: IGNITE-633
> URL: https://issues.apache.org/jira/browse/IGNITE-633
> Project: Ignite
> Issue Type: Test
> Components: hadoop
> Affects Versions: sprint-2
> Reporter: Ivan Veselovsky
> Assignee: Vladimir Ozerov
> Fix For: sprint-6
>
>
> Test HadoopMapReduceEmbeddedSelfTest.testWholeMapReduceExecution
> java.util.concurrent.TimeoutException: Test has been timed out
> [test=testWholeMapReduceExecution, timeout=300000]
> at
> org.apache.ignite.testframework.junits.GridAbstractTest.runTest(GridAbstractTest.java:1317)
> 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:255)
> at junit.framework.TestSuite.run(TestSuite.java:250)
> at junit.framework.TestSuite.runTest(TestSuite.java:255)
> at junit.framework.TestSuite.run(TestSuite.java:250)
> at
> org.junit.internal.runners.JUnit38ClassRunner.run(JUnit38ClassRunner.java:84)
> at
> org.apache.maven.surefire.junit4.JUnit4Provider.execute(JUnit4Provider.java:264)
> at
> org.apache.maven.surefire.junit4.JUnit4Provider.executeTestSet(JUnit4Provider.java:153)
> at
> org.apache.maven.surefire.junit4.JUnit4Provider.invoke(JUnit4Provider.java:124)
> 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
> org.apache.maven.surefire.util.ReflectionUtils.invokeMethodWithArray2(ReflectionUtils.java:208)
> at
> org.apache.maven.surefire.booter.ProviderFactory$ProviderProxy.invoke(ProviderFactory.java:156)
> at
> org.apache.maven.surefire.booter.ProviderFactory.invokeProvider(ProviderFactory.java:82)
> at
> org.apache.maven.plugin.surefire.InPluginVMSurefireStarter.runSuitesInProcess(InPluginVMSurefireStarter.java:82)
> at
> org.apache.maven.plugin.surefire.AbstractSurefireMojo.executeProvider(AbstractSurefireMojo.java:951)
> at
> org.apache.maven.plugin.surefire.AbstractSurefireMojo.executeAfterPreconditionsChecked(AbstractSurefireMojo.java:831)
> at
> org.apache.maven.plugin.surefire.AbstractSurefireMojo.execute(AbstractSurefireMojo.java:729)
> at
> org.apache.maven.plugin.DefaultBuildPluginManager.executeMojo(DefaultBuildPluginManager.java:101)
> at
> org.apache.maven.lifecycle.internal.MojoExecutor.execute(MojoExecutor.java:209)
> at
> org.apache.maven.lifecycle.internal.MojoExecutor.execute(MojoExecutor.java:153)
> at
> org.apache.maven.lifecycle.internal.MojoExecutor.execute(MojoExecutor.java:145)
> at
> org.apache.maven.lifecycle.internal.LifecycleModuleBuilder.buildProject(LifecycleModuleBuilder.java:84)
> at
> org.apache.maven.lifecycle.internal.LifecycleModuleBuilder.buildProject(LifecycleModuleBuilder.java:59)
> at
> org.apache.maven.lifecycle.internal.LifecycleStarter.singleThreadedBuild(LifecycleStarter.java:183)
> at
> org.apache.maven.lifecycle.internal.LifecycleStarter.execute(LifecycleStarter.java:161)
> at org.apache.maven.DefaultMaven.doExecute(DefaultMaven.java:320)
> at org.apache.maven.DefaultMaven.execute(DefaultMaven.java:156)
> at org.apache.maven.cli.MavenCli.execute(MavenCli.java:537)
> at org.apache.maven.cli.MavenCli.doMain(MavenCli.java:196)
> at org.apache.maven.cli.MavenCli.main(MavenCli.java:141)
> 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
> org.codehaus.plexus.classworlds.launcher.Launcher.launchEnhanced(Launcher.java:290)
> at
> org.codehaus.plexus.classworlds.launcher.Launcher.launch(Launcher.java:230)
> at
> org.codehaus.plexus.classworlds.launcher.Launcher.mainWithExitCode(Launcher.java:409)
> at
> org.codehaus.plexus.classworlds.launcher.Launcher.main(Launcher.java:352)
> ------- Stdout: -------
> [16:37:40,133][INFO ][main][root] >>> Starting test:
> testWholeMapReduceExecution <<<
> [16:37:40,161][INFO ][main][HadoopMapReduceEmbeddedSelfTest0]
> >>> __________ ________________
> >>> / _/ ___/ |/ / _/_ __/ __/
> >>> _/ // (7 7 // / / / / _/
> >>> /___/\___/_/|_/___/ /_/ /___/
> >>>
> >>> ver. 1.0.0#19700101-sha1:DEV
> >>> 2015 Copyright(C) Apache Software Foundation
> [16:37:40,161][INFO ][main][HadoopMapReduceEmbeddedSelfTest0] Config URL: n/a
> [16:37:40,161][INFO ][main][HadoopMapReduceEmbeddedSelfTest0] Daemon mode: off
> [16:37:40,161][INFO ][main][HadoopMapReduceEmbeddedSelfTest0] OS: Linux
> 2.6.32-38-generic amd64
> [16:37:40,161][INFO ][main][HadoopMapReduceEmbeddedSelfTest0] OS user:
> teamcity
> [16:37:40,161][INFO ][main][HadoopMapReduceEmbeddedSelfTest0] Language
> runtime: Java Platform API Specification ver. 1.7
> [16:37:40,161][INFO ][main][HadoopMapReduceEmbeddedSelfTest0] VM information:
> Java(TM) SE Runtime Environment 1.7.0_67-b01 Oracle Corporation Java
> HotSpot(TM) 64-Bit Server VM 24.65-b04
> [16:37:40,161][INFO ][main][HadoopMapReduceEmbeddedSelfTest0] VM total
> memory: 2.9GB
> [16:37:40,161][INFO ][main][HadoopMapReduceEmbeddedSelfTest0] Remote
> Management [restart: off, REST: off, JMX (remote: off)]
> [16:37:40,161][INFO ][main][HadoopMapReduceEmbeddedSelfTest0]
> IGNITE_HOME=/usr/local/TeamCityAgent/work/c326f6bf1927b309
> [16:37:40,161][INFO ][main][HadoopMapReduceEmbeddedSelfTest0] VM arguments:
> [-DJAVA_HOME=/usr/lib/jvm/java-7-oracle, -DMCAST_GRP=229.17.1.2,
> -Dagent.home.dir=/usr/local/TeamCityAgent, -Dagent.name=teamcity-7,
> -Dagent.ownPort=9090, -Dagent.work.dir=/usr/local/TeamCityAgent/work,
> -Dbuild.number=1560,
> -Dbuild.vcs.number=cb074fe98614907b0dd20fca71a44beb2dc5d8f4,
> -Dbuild.vcs.number.1=cb074fe98614907b0dd20fca71a44beb2dc5d8f4,
> -Dbuild.vcs.number.IgniteApache=cb074fe98614907b0dd20fca71a44beb2dc5d8f4,
> -Dclassworlds.conf=/usr/local/TeamCityAgent/temp/buildTmp/teamcity.m2.conf,
> -Dcom.jetbrains.maven.watcher.report.file=/usr/local/TeamCityAgent/temp/buildTmp/maven-build-info.xml,
> -Dhadoop.version=2.5.2,
> -Djava.io.tmpdir=/usr/local/TeamCityAgent/temp/buildTmp,
> -Dmaven.home=/usr/local/TeamCityAgent/tools/maven3,
> -Dmaven.repo.local=/home/teamcity/.m2/repository,
> -Dteamcity.agent.cpuBenchmark=663,
> -Dteamcity.agent.dotnet.agent_url=http://localhost:9090/RPC2,
> -Dteamcity.agent.dotnet.build_id=400410,
> -Dteamcity.auth.password=nu1IIi3SWEb8NNhLDhghzpZjQSPWkYV3,
> -Dteamcity.auth.userId=TeamCityBuildId=400410,
> -Dteamcity.build.changedFiles.file=/usr/local/TeamCityAgent/temp/buildTmp/changedFiles6192942218181221816.txt,
> -Dteamcity.build.checkoutDir=/usr/local/TeamCityAgent/work/c326f6bf1927b309,
> -Dteamcity.build.id=400410,
> -Dteamcity.build.properties.file=/usr/local/TeamCityAgent/temp/buildTmp/teamcity.build1936164090676629649.properties,
> -Dteamcity.build.tempDir=/usr/local/TeamCityAgent/temp/buildTmp,
> -Dteamcity.build.workingDir=/usr/local/TeamCityAgent/work/c326f6bf1927b309,
> -Dteamcity.buildConfName=Ignite Hadoop,
> -Dteamcity.buildType.id=Ignite_Hadoop,
> -Dteamcity.configuration.properties.file=/usr/local/TeamCityAgent/temp/buildTmp/teamcity.config1651692759705343482.properties,
> -Dteamcity.idea.home=/usr/local/TeamCityAgent/plugins/idea,
> -Dteamcity.maven.watcher.home=/usr/local/TeamCityAgent/plugins/mavenPlugin/maven-watcher,
> -Dteamcity.projectName=Ignite,
> -Dteamcity.runner.properties.file=/usr/local/TeamCityAgent/temp/buildTmp/teamcity.runner4645183226190514392.properties,
>
> -Dteamcity.tests.recentlyFailedTests.file=/usr/local/TeamCityAgent/temp/buildTmp/testsToRunFirst6297047454049666673.txt,
> -Dteamcity.version=8.1.4 (build 30168), -ea, -XX:MaxPermSize=2g, -Xms1g,
> -Xmx3g, -XX:+HeapDumpOnOutOfMemoryError, -XX:+AggressiveOpts,
> -DIGNITE_TEST_HOME=/usr/local/TeamCityAgent/work/c326f6bf1927b309,
> -DIGNITE_UPDATE_NOTIFIER=false, -DIGNITE_NO_DISCO_ORDER=true,
> -DIGNITE_QUIET=false, -XX:+PrintGC, -XX:+PrintGCDetails,
> -XX:+PrintGCTimeStamps]
> [16:37:40,162][INFO ][main][HadoopMapReduceEmbeddedSelfTest0] Configured
> caches ['ignite-marshaller-sys-cache', 'ignite-sys-cache',
> 'ignite-hadoop-mr-sys-cache', 'ignite-atomics-sys-cache', 'meta', 'data']
> [16:37:40,162][INFO ][main][HadoopMapReduceEmbeddedSelfTest0] 3-rd party
> licenses can be found at:
> /usr/local/TeamCityAgent/work/c326f6bf1927b309/libs/licenses
> [16:37:40,174][INFO ][main][HadoopMapReduceEmbeddedSelfTest0] Non-loopback
> local IPs: 192.168.2.17, fe80:0:0:0:ca60:ff:fe68:5868%2
> [16:37:40,174][INFO ][main][HadoopMapReduceEmbeddedSelfTest0] Enabled local
> MACs: C86000685868
> [16:37:40,175][INFO ][main][IgnitePluginProcessor] Configured plugins:
> [16:37:40,175][INFO ][main][IgnitePluginProcessor] ^-- None
> [16:37:40,175][INFO ][main][IgnitePluginProcessor]
> [16:37:40,189][INFO ][main][TcpCommunicationSpi] Successfully bound to TCP
> port [port=45190, locHost=/127.0.0.1]
> [16:37:40,221][INFO ][main][HadoopMapReduceEmbeddedSelfTest0] Security status
> [authentication=off]
> [16:37:40,241][INFO ][main][IpcSharedMemoryServerEndpoint] IPC shared memory
> server endpoint started [port=10500,
> tokDir=/usr/local/TeamCityAgent/work/c326f6bf1927b309/work/ipc/shmem/954f246d-c071-4378-b678-3d34f5e19eb0-21398]
> [16:37:40,242][INFO ][main][IpcServerTcpEndpoint] IPC server loopback
> endpoint started [port=11400]
> [16:37:40,242][INFO ][main][HadoopProcessor] HADOOP_HOME is set to
> /usr/local/TeamCityAgent/temp/buildTmp/__hadoop/hadoop-2.5.2
> [16:37:40,263][INFO ][main][TcpDiscoverySpi] Successfully bound to TCP port
> [port=47500, localHost=/127.0.0.1]
> [16:37:40,273][INFO ][main][GridCacheProcessor] Started cache
> [name=ignite-marshaller-sys-cache, mode=REPLICATED]
> [16:37:40,278][INFO ][main][GridCacheProcessor] Started cache [name=meta,
> mode=REPLICATED]
> [16:37:40,284][INFO ][main][GridCacheProcessor] Started cache
> [name=ignite-hadoop-mr-sys-cache, mode=REPLICATED]
> [16:37:40,292][INFO ][main][GridCacheProcessor] Started cache
> [name=ignite-atomics-sys-cache, mode=PARTITIONED]
> [16:37:40,299][INFO ][main][GridCacheProcessor] Started cache [name=data,
> mode=PARTITIONED]
> [16:37:40,304][INFO ][main][GridCacheProcessor] Started cache
> [name=ignite-sys-cache, mode=REPLICATED]
> [16:37:40,425][INFO ][main][GridDhtPreloader] <ignite-marshaller-sys-cache>
> Starting rebalancing in SYNC mode: ignite-marshaller-sys-cache
> [16:37:40,425][INFO ][main][GridDhtPreloader] <ignite-hadoop-mr-sys-cache>
> Starting rebalancing in SYNC mode: ignite-hadoop-mr-sys-cache
> [16:37:40,425][INFO ][main][GridDhtPreloader] <meta> Starting rebalancing in
> ASYNC mode: meta
> [16:37:40,425][INFO ][main][GridDhtPreloader] <ignite-atomics-sys-cache>
> Starting rebalancing in SYNC mode: ignite-atomics-sys-cache
> [16:37:40,426][INFO ][main][GridDhtPreloader] <data> Starting rebalancing in
> ASYNC mode: data
> [16:37:40,426][INFO ][main][GridDhtPreloader] <ignite-sys-cache> Starting
> rebalancing in SYNC mode: ignite-sys-cache
> [16:37:40,465][INFO
> ][preloader-demand-worker-#19997%hadoop.HadoopMapReduceEmbeddedSelfTest0%][GridDhtPreloader]
> <ignite-marshaller-sys-cache> Completed rebalancing in SYNC mode
> [cache=ignite-marshaller-sys-cache, time=40 ms]
> [16:37:40,465][INFO
> ][preloader-demand-worker-#20001%hadoop.HadoopMapReduceEmbeddedSelfTest0%][GridDhtPreloader]
> <ignite-hadoop-mr-sys-cache> Completed rebalancing in SYNC mode
> [cache=ignite-hadoop-mr-sys-cache, time=40 ms]
> [16:37:40,465][INFO
> ][preloader-demand-worker-#20006%hadoop.HadoopMapReduceEmbeddedSelfTest0%][GridDhtPreloader]
> <meta> Completed rebalancing in ASYNC mode [cache=meta, time=30 ms]
> [16:37:40,465][INFO
> ][preloader-demand-worker-#20017%hadoop.HadoopMapReduceEmbeddedSelfTest0%][GridDhtPreloader]
> <data> Completed rebalancing in ASYNC mode [cache=data, time=30 ms]
> [16:37:40,465][INFO
> ][preloader-demand-worker-#20011%hadoop.HadoopMapReduceEmbeddedSelfTest0%][GridDhtPreloader]
> <ignite-atomics-sys-cache> Completed rebalancing in SYNC mode
> [cache=ignite-atomics-sys-cache, time=30 ms]
> [16:37:40,465][INFO
> ][preloader-demand-worker-#20022%hadoop.HadoopMapReduceEmbeddedSelfTest0%][GridDhtPreloader]
> <ignite-sys-cache> Completed rebalancing in SYNC mode
> [cache=ignite-sys-cache, time=30 ms]
> [16:37:40,505][INFO ][main][HadoopMapReduceEmbeddedSelfTest0] Performance
> suggestions for grid 'hadoop.HadoopMapReduceEmbeddedSelfTest0' (fix if
> possible)
> [16:37:40,505][INFO ][main][HadoopMapReduceEmbeddedSelfTest0] To disable, set
> -DIGNITE_PERFORMANCE_SUGGESTIONS_DISABLED=true
> [16:37:40,505][INFO ][main][HadoopMapReduceEmbeddedSelfTest0] ^-- Disable
> checkpoints (remove 'checkpointSpi' from configuration)
> [16:37:40,505][INFO ][main][HadoopMapReduceEmbeddedSelfTest0] ^-- Disable
> grid events (remove 'includeEventTypes' from configuration)
> [16:37:40,505][INFO ][main][HadoopMapReduceEmbeddedSelfTest0]
> [16:37:40,505][INFO ][main][HadoopMapReduceEmbeddedSelfTest0] To start
> Console Management & Monitoring run ignitevisorcmd.{sh|bat}
> [16:37:40,505][INFO ][main][HadoopMapReduceEmbeddedSelfTest0]
> [16:37:40,506][INFO ][main][HadoopMapReduceEmbeddedSelfTest0]
> >>> +---------------------------------+
> >>> Ignite ver. 1.0.0#19700101-sha1:DEV
> >>> +---------------------------------+
> >>> OS name: Linux 2.6.32-38-generic amd64
> >>> CPU(s): 4
> >>> Heap: 2.9GB
> >>> VM name: 21398@gg-teamcity-7
> >>> Grid name: hadoop.HadoopMapReduceEmbeddedSelfTest0
> >>> Local node [ID=954F246D-C071-4378-B678-3D34F5E19EB0, order=1]
> >>> Local node addresses: [/127.0.0.1]
> >>> Local ports: TCP:10500 TCP:11400 TCP:45190 TCP:47500
> >>> Ignite documentation: http://ignite.incubator.apache.org
> [16:37:40,506][INFO ][main][GridDiscoveryManager] Topology snapshot [ver=1,
> nodes=1, CPUs=4, heap=2.9GB]
> [16:37:40,522][INFO ][main][HadoopMapReduceEmbeddedSelfTest1]
> >>> __________ ________________
> >>> / _/ ___/ |/ / _/_ __/ __/
> >>> _/ // (7 7 // / / / / _/
> >>> /___/\___/_/|_/___/ /_/ /___/
> >>>
> >>> ver. 1.0.0#19700101-sha1:DEV
> >>> 2015 Copyright(C) Apache Software Foundation
> [16:37:40,522][INFO ][main][HadoopMapReduceEmbeddedSelfTest1] Config URL: n/a
> [16:37:40,522][INFO ][main][HadoopMapReduceEmbeddedSelfTest1] Daemon mode: off
> [16:37:40,522][INFO ][main][HadoopMapReduceEmbeddedSelfTest1] OS: Linux
> 2.6.32-38-generic amd64
> [16:37:40,522][INFO ][main][HadoopMapReduceEmbeddedSelfTest1] OS user:
> teamcity
> [16:37:40,522][INFO ][main][HadoopMapReduceEmbeddedSelfTest1] Language
> runtime: Java Platform API Specification ver. 1.7
> [16:37:40,522][INFO ][main][HadoopMapReduceEmbeddedSelfTest1] VM information:
> Java(TM) SE Runtime Environment 1.7.0_67-b01 Oracle Corporation Java
> HotSpot(TM) 64-Bit Server VM 24.65-b04
> [16:37:40,522][INFO ][main][HadoopMapReduceEmbeddedSelfTest1] VM total
> memory: 2.9GB
> [16:37:40,522][INFO ][main][HadoopMapReduceEmbeddedSelfTest1] Remote
> Management [restart: off, REST: off, JMX (remote: off)]
> [16:37:40,522][INFO ][main][HadoopMapReduceEmbeddedSelfTest1]
> IGNITE_HOME=/usr/local/TeamCityAgent/work/c326f6bf1927b309
> [16:37:40,523][INFO ][main][HadoopMapReduceEmbeddedSelfTest1] VM arguments:
> [-DJAVA_HOME=/usr/lib/jvm/java-7-oracle, -DMCAST_GRP=229.17.1.2,
> -Dagent.home.dir=/usr/local/TeamCityAgent, -Dagent.name=teamcity-7,
> -Dagent.ownPort=9090, -Dagent.work.dir=/usr/local/TeamCityAgent/work,
> -Dbuild.number=1560,
> -Dbuild.vcs.number=cb074fe98614907b0dd20fca71a44beb2dc5d8f4,
> -Dbuild.vcs.number.1=cb074fe98614907b0dd20fca71a44beb2dc5d8f4,
> -Dbuild.vcs.number.IgniteApache=cb074fe98614907b0dd20fca71a44beb2dc5d8f4,
> -Dclassworlds.conf=/usr/local/TeamCityAgent/temp/buildTmp/teamcity.m2.conf,
> -Dcom.jetbrains.maven.watcher.report.file=/usr/local/TeamCityAgent/temp/buildTmp/maven-build-info.xml,
> -Dhadoop.version=2.5.2,
> -Djava.io.tmpdir=/usr/local/TeamCityAgent/temp/buildTmp,
> -Dmaven.home=/usr/local/TeamCityAgent/tools/maven3,
> -Dmaven.repo.local=/home/teamcity/.m2/repository,
> -Dteamcity.agent.cpuBenchmark=663,
> -Dteamcity.agent.dotnet.agent_url=http://localhost:9090/RPC2,
> -Dteamcity.agent.dotnet.build_id=400410,
> -Dteamcity.auth.password=nu1IIi3SWEb8NNhLDhghzpZjQSPWkYV3,
> -Dteamcity.auth.userId=TeamCityBuildId=400410,
> -Dteamcity.build.changedFiles.file=/usr/local/TeamCityAgent/temp/buildTmp/changedFiles6192942218181221816.txt,
> -Dteamcity.build.checkoutDir=/usr/local/TeamCityAgent/work/c326f6bf1927b309,
> -Dteamcity.build.id=400410,
> -Dteamcity.build.properties.file=/usr/local/TeamCityAgent/temp/buildTmp/teamcity.build1936164090676629649.properties,
> -Dteamcity.build.tempDir=/usr/local/TeamCityAgent/temp/buildTmp,
> -Dteamcity.build.workingDir=/usr/local/TeamCityAgent/work/c326f6bf1927b309,
> -Dteamcity.buildConfName=Ignite Hadoop,
> -Dteamcity.buildType.id=Ignite_Hadoop,
> -Dteamcity.configuration.properties.file=/usr/local/TeamCityAgent/temp/buildTmp/teamcity.config1651692759705343482.properties,
> -Dteamcity.idea.home=/usr/local/TeamCityAgent/plugins/idea,
> -Dteamcity.maven.watcher.home=/usr/local/TeamCityAgent/plugins/mavenPlugin/maven-watcher,
> -Dteamcity.projectName=Ignite,
> -Dteamcity.runner.properties.file=/usr/local/TeamCityAgent/temp/buildTmp/teamcity.runner4645183226190514392.properties,
>
> -Dteamcity.tests.recentlyFailedTests.file=/usr/local/TeamCityAgent/temp/buildTmp/testsToRunFirst6297047454049666673.txt,
> -Dteamcity.version=8.1.4 (build 30168), -ea, -XX:MaxPermSize=2g, -Xms1g,
> -Xmx3g, -XX:+HeapDumpOnOutOfMemoryError, -XX:+AggressiveOpts,
> -DIGNITE_TEST_HOME=/usr/local/TeamCityAgent/work/c326f6bf1927b309,
> -DIGNITE_UPDATE_NOTIFIER=false, -DIGNITE_NO_DISCO_ORDER=true,
> -DIGNITE_QUIET=false, -XX:+PrintGC, -XX:+PrintGCDetails,
> -XX:+PrintGCTimeStamps]
> [16:37:40,523][INFO ][main][HadoopMapReduceEmbeddedSelfTest1] Configured
> caches ['ignite-marshaller-sys-cache', 'ignite-sys-cache',
> 'ignite-hadoop-mr-sys-cache', 'ignite-atomics-sys-cache', 'meta', 'data']
> [16:37:40,523][INFO ][main][HadoopMapReduceEmbeddedSelfTest1] 3-rd party
> licenses can be found at:
> /usr/local/TeamCityAgent/work/c326f6bf1927b309/libs/licenses
> [16:37:40,535][INFO ][main][HadoopMapReduceEmbeddedSelfTest1] Non-loopback
> local IPs: 192.168.2.17, fe80:0:0:0:ca60:ff:fe68:5868%2
> [16:37:40,535][INFO ][main][HadoopMapReduceEmbeddedSelfTest1] Enabled local
> MACs: C86000685868
> [16:37:40,536][INFO ][main][IgnitePluginProcessor] Configured plugins:
> [16:37:40,536][INFO ][main][IgnitePluginProcessor] ^-- None
> [16:37:40,536][INFO ][main][IgnitePluginProcessor]
> [16:37:40,551][INFO ][main][TcpCommunicationSpi] Successfully bound to TCP
> port [port=45191, locHost=/127.0.0.1]
> [16:37:40,582][INFO ][main][HadoopMapReduceEmbeddedSelfTest1] Security status
> [authentication=off]
> [16:37:40,602][INFO ][main][HadoopProcessor] HADOOP_HOME is set to
> /usr/local/TeamCityAgent/temp/buildTmp/__hadoop/hadoop-2.5.2
> [16:37:40,624][INFO ][main][TcpDiscoverySpi] Successfully bound to TCP port
> [port=47501, localHost=/127.0.0.1]
> [16:37:40,701][INFO
> ][disco-event-worker-#19989%hadoop.HadoopMapReduceEmbeddedSelfTest0%][GridDiscoveryManager]
> Added new node to topology: TcpDiscoveryNode
> [id=7a924c9a-3284-476f-ad7c-6ddc7d6b3edd, addrs=[127.0.0.1],
> sockAddrs=[/127.0.0.1:47501], discPort=47501, order=2, intOrder=2, loc=false,
> ver=1.0.0#19700101-sha1:00000000, isClient=false]
> [16:37:40,702][INFO
> ][disco-event-worker-#19989%hadoop.HadoopMapReduceEmbeddedSelfTest0%][GridDiscoveryManager]
> Topology snapshot [ver=2, nodes=2, CPUs=4, heap=2.9GB]
> [16:37:40,715][INFO ][main][GridCacheProcessor] Started cache
> [name=ignite-marshaller-sys-cache, mode=REPLICATED]
> [16:37:40,721][INFO ][main][GridCacheProcessor] Started cache [name=meta,
> mode=REPLICATED]
> [16:37:40,726][INFO ][main][GridCacheProcessor] Started cache
> [name=ignite-hadoop-mr-sys-cache, mode=REPLICATED]
> [16:37:40,735][INFO ][main][GridCacheProcessor] Started cache
> [name=ignite-atomics-sys-cache, mode=PARTITIONED]
> [16:37:40,741][INFO ][main][GridCacheProcessor] Started cache [name=data,
> mode=PARTITIONED]
> [16:37:40,747][INFO ][main][GridCacheProcessor] Started cache
> [name=ignite-sys-cache, mode=REPLICATED]
> [16:37:42,075][INFO ][main][GridDhtPreloader] <ignite-marshaller-sys-cache>
> Starting rebalancing in SYNC mode: ignite-marshaller-sys-cache
> [16:37:42,075][INFO ][main][GridDhtPreloader] <ignite-hadoop-mr-sys-cache>
> Starting rebalancing in SYNC mode: ignite-hadoop-mr-sys-cache
> [16:37:42,076][INFO ][main][GridDhtPreloader] <meta> Starting rebalancing in
> ASYNC mode: meta
> [16:37:42,076][INFO ][main][GridDhtPreloader] <ignite-atomics-sys-cache>
> Starting rebalancing in SYNC mode: ignite-atomics-sys-cache
> [16:37:42,076][INFO ][main][GridDhtPreloader] <data> Starting rebalancing in
> ASYNC mode: data
> [16:37:42,076][INFO ][main][GridDhtPreloader] <ignite-sys-cache> Starting
> rebalancing in SYNC mode: ignite-sys-cache
> [16:37:42,237][INFO
> ][preloader-demand-worker-#20074%hadoop.HadoopMapReduceEmbeddedSelfTest1%][GridDhtPreloader]
> <ignite-marshaller-sys-cache> Completed rebalancing in SYNC mode
> [cache=ignite-marshaller-sys-cache, time=171 ms]
> [16:37:42,255][INFO
> ][preloader-demand-worker-#20102%hadoop.HadoopMapReduceEmbeddedSelfTest1%][GridDhtPreloader]
> <ignite-sys-cache> Completed rebalancing in SYNC mode
> [cache=ignite-sys-cache, time=171 ms]
> [16:37:42,298][INFO
> ][preloader-demand-worker-#20090%hadoop.HadoopMapReduceEmbeddedSelfTest1%][GridDhtPreloader]
> <ignite-atomics-sys-cache> Completed rebalancing in SYNC mode
> [cache=ignite-atomics-sys-cache, time=231 ms]
> [16:37:42,302][INFO
> ][preloader-demand-worker-#20087%hadoop.HadoopMapReduceEmbeddedSelfTest1%][GridDhtPreloader]
> <meta> Completed rebalancing in ASYNC mode [cache=meta, time=231 ms]
> [16:37:42,305][INFO
> ][preloader-demand-worker-#20080%hadoop.HadoopMapReduceEmbeddedSelfTest1%][GridDhtPreloader]
> <ignite-hadoop-mr-sys-cache> Completed rebalancing in SYNC mode
> [cache=ignite-hadoop-mr-sys-cache, time=231 ms]
> [16:37:42,307][INFO
> ][preloader-demand-worker-#20097%hadoop.HadoopMapReduceEmbeddedSelfTest1%][GridDhtPreloader]
> <data> Completed rebalancing in ASYNC mode [cache=data, time=231 ms]
> [16:37:42,331][INFO ][main][HadoopMapReduceEmbeddedSelfTest1] Performance
> suggestions for grid 'hadoop.HadoopMapReduceEmbeddedSelfTest1' (fix if
> possible)
> [16:37:42,332][INFO ][main][HadoopMapReduceEmbeddedSelfTest1] To disable, set
> -DIGNITE_PERFORMANCE_SUGGESTIONS_DISABLED=true
> [16:37:42,332][INFO ][main][HadoopMapReduceEmbeddedSelfTest1] ^-- Disable
> checkpoints (remove 'checkpointSpi' from configuration)
> [16:37:42,332][INFO ][main][HadoopMapReduceEmbeddedSelfTest1] ^-- Disable
> grid events (remove 'includeEventTypes' from configuration)
> [16:37:42,332][INFO ][main][HadoopMapReduceEmbeddedSelfTest1]
> [16:37:42,332][INFO ][main][HadoopMapReduceEmbeddedSelfTest1] To start
> Console Management & Monitoring run ignitevisorcmd.{sh|bat}
> [16:37:42,332][INFO ][main][HadoopMapReduceEmbeddedSelfTest1]
> [16:37:42,332][INFO ][main][HadoopMapReduceEmbeddedSelfTest1]
> >>> +---------------------------------+
> >>> Ignite ver. 1.0.0#19700101-sha1:DEV
> >>> +---------------------------------+
> >>> OS name: Linux 2.6.32-38-generic amd64
> >>> CPU(s): 4
> >>> Heap: 2.8GB
> >>> VM name: 21398@gg-teamcity-7
> >>> Grid name: hadoop.HadoopMapReduceEmbeddedSelfTest1
> >>> Local node [ID=7A924C9A-3284-476F-AD7C-6DDC7D6B3EDD, order=2]
> >>> Local node addresses: [/127.0.0.1]
> >>> Local ports: TCP:45191 TCP:47501
> >>> Ignite documentation: http://ignite.incubator.apache.org
> [16:37:42,333][INFO ][main][GridDiscoveryManager] Topology snapshot [ver=2,
> nodes=2, CPUs=4, heap=2.8GB]
> [16:37:42,348][INFO ][main][HadoopMapReduceEmbeddedSelfTest2]
> >>> __________ ________________
> >>> / _/ ___/ |/ / _/_ __/ __/
> >>> _/ // (7 7 // / / / / _/
> >>> /___/\___/_/|_/___/ /_/ /___/
> >>>
> >>> ver. 1.0.0#19700101-sha1:DEV
> >>> 2015 Copyright(C) Apache Software Foundation
> [16:37:42,348][INFO ][main][HadoopMapReduceEmbeddedSelfTest2] Config URL: n/a
> [16:37:42,348][INFO ][main][HadoopMapReduceEmbeddedSelfTest2] Daemon mode: off
> [16:37:42,349][INFO ][main][HadoopMapReduceEmbeddedSelfTest2] OS: Linux
> 2.6.32-38-generic amd64
> [16:37:42,349][INFO ][main][HadoopMapReduceEmbeddedSelfTest2] OS user:
> teamcity
> [16:37:42,350][INFO ][main][HadoopMapReduceEmbeddedSelfTest2] Language
> runtime: Java Platform API Specification ver. 1.7
> [16:37:42,350][INFO ][main][HadoopMapReduceEmbeddedSelfTest2] VM information:
> Java(TM) SE Runtime Environment 1.7.0_67-b01 Oracle Corporation Java
> HotSpot(TM) 64-Bit Server VM 24.65-b04
> [16:37:42,350][INFO ][main][HadoopMapReduceEmbeddedSelfTest2] VM total
> memory: 2.8GB
> [16:37:42,350][INFO ][main][HadoopMapReduceEmbeddedSelfTest2] Remote
> Management [restart: off, REST: off, JMX (remote: off)]
> [16:37:42,350][INFO ][main][HadoopMapReduceEmbeddedSelfTest2]
> IGNITE_HOME=/usr/local/TeamCityAgent/work/c326f6bf1927b309
> [16:37:42,350][INFO ][main][HadoopMapReduceEmbeddedSelfTest2] VM arguments:
> [-DJAVA_HOME=/usr/lib/jvm/java-7-oracle, -DMCAST_GRP=229.17.1.2,
> -Dagent.home.dir=/usr/local/TeamCityAgent, -Dagent.name=teamcity-7,
> -Dagent.ownPort=9090, -Dagent.work.dir=/usr/local/TeamCityAgent/work,
> -Dbuild.number=1560,
> -Dbuild.vcs.number=cb074fe98614907b0dd20fca71a44beb2dc5d8f4,
> -Dbuild.vcs.number.1=cb074fe98614907b0dd20fca71a44beb2dc5d8f4,
> -Dbuild.vcs.number.IgniteApache=cb074fe98614907b0dd20fca71a44beb2dc5d8f4,
> -Dclassworlds.conf=/usr/local/TeamCityAgent/temp/buildTmp/teamcity.m2.conf,
> -Dcom.jetbrains.maven.watcher.report.file=/usr/local/TeamCityAgent/temp/buildTmp/maven-build-info.xml,
> -Dhadoop.version=2.5.2,
> -Djava.io.tmpdir=/usr/local/TeamCityAgent/temp/buildTmp,
> -Dmaven.home=/usr/local/TeamCityAgent/tools/maven3,
> -Dmaven.repo.local=/home/teamcity/.m2/repository,
> -Dteamcity.agent.cpuBenchmark=663,
> -Dteamcity.agent.dotnet.agent_url=http://localhost:9090/RPC2,
> -Dteamcity.agent.dotnet.build_id=400410,
> -Dteamcity.auth.password=nu1IIi3SWEb8NNhLDhghzpZjQSPWkYV3,
> -Dteamcity.auth.userId=TeamCityBuildId=400410,
> -Dteamcity.build.changedFiles.file=/usr/local/TeamCityAgent/temp/buildTmp/changedFiles6192942218181221816.txt,
> -Dteamcity.build.checkoutDir=/usr/local/TeamCityAgent/work/c326f6bf1927b309,
> -Dteamcity.build.id=400410,
> -Dteamcity.build.properties.file=/usr/local/TeamCityAgent/temp/buildTmp/teamcity.build1936164090676629649.properties,
> -Dteamcity.build.tempDir=/usr/local/TeamCityAgent/temp/buildTmp,
> -Dteamcity.build.workingDir=/usr/local/TeamCityAgent/work/c326f6bf1927b309,
> -Dteamcity.buildConfName=Ignite Hadoop,
> -Dteamcity.buildType.id=Ignite_Hadoop,
> -Dteamcity.configuration.properties.file=/usr/local/TeamCityAgent/temp/buildTmp/teamcity.config1651692759705343482.properties,
> -Dteamcity.idea.home=/usr/local/TeamCityAgent/plugins/idea,
> -Dteamcity.maven.watcher.home=/usr/local/TeamCityAgent/plugins/mavenPlugin/maven-watcher,
> -Dteamcity.projectName=Ignite,
> -Dteamcity.runner.properties.file=/usr/local/TeamCityAgent/temp/buildTmp/teamcity.runner4645183226190514392.properties,
>
> -Dteamcity.tests.recentlyFailedTests.file=/usr/local/TeamCityAgent/temp/buildTmp/testsToRunFirst6297047454049666673.txt,
> -Dteamcity.version=8.1.4 (build 30168), -ea, -XX:MaxPermSize=2g, -Xms1g,
> -Xmx3g, -XX:+HeapDumpOnOutOfMemoryError, -XX:+AggressiveOpts,
> -DIGNITE_TEST_HOME=/usr/local/TeamCityAgent/work/c326f6bf1927b309,
> -DIGNITE_UPDATE_NOTIFIER=false, -DIGNITE_NO_DISCO_ORDER=true,
> -DIGNITE_QUIET=false, -XX:+PrintGC, -XX:+PrintGCDetails,
> -XX:+PrintGCTimeStamps]
> [16:37:42,351][INFO ][main][HadoopMapReduceEmbeddedSelfTest2] Configured
> caches ['ignite-marshaller-sys-cache', 'ignite-sys-cache',
> 'ignite-hadoop-mr-sys-cache', 'ignite-atomics-sys-cache', 'meta', 'data']
> [16:37:42,351][INFO ][main][HadoopMapReduceEmbeddedSelfTest2] 3-rd party
> licenses can be found at:
> /usr/local/TeamCityAgent/work/c326f6bf1927b309/libs/licenses
> [16:37:42,363][INFO ][main][HadoopMapReduceEmbeddedSelfTest2] Non-loopback
> local IPs: 192.168.2.17, fe80:0:0:0:ca60:ff:fe68:5868%2
> [16:37:42,363][INFO ][main][HadoopMapReduceEmbeddedSelfTest2] Enabled local
> MACs: C86000685868
> [16:37:42,364][INFO ][main][IgnitePluginProcessor] Configured plugins:
> [16:37:42,364][INFO ][main][IgnitePluginProcessor] ^-- None
> [16:37:42,364][INFO ][main][IgnitePluginProcessor]
> [16:37:42,379][INFO ][main][TcpCommunicationSpi] Successfully bound to TCP
> port [port=45192, locHost=/127.0.0.1]
> [16:37:42,411][INFO ][main][HadoopMapReduceEmbeddedSelfTest2] Security status
> [authentication=off]
> [16:37:42,432][INFO ][main][HadoopProcessor] HADOOP_HOME is set to
> /usr/local/TeamCityAgent/temp/buildTmp/__hadoop/hadoop-2.5.2
> [16:37:42,453][INFO ][main][TcpDiscoverySpi] Successfully bound to TCP port
> [port=47502, localHost=/127.0.0.1]
> [16:37:42,598][INFO
> ][disco-event-worker-#19989%hadoop.HadoopMapReduceEmbeddedSelfTest0%][GridDiscoveryManager]
> Added new node to topology: TcpDiscoveryNode
> [id=d313c493-0cbc-4ada-a03e-e48802166818, addrs=[127.0.0.1],
> sockAddrs=[/127.0.0.1:47502], discPort=47502, order=3, intOrder=3, loc=false,
> ver=1.0.0#19700101-sha1:00000000, isClient=false]
> [16:37:42,599][INFO
> ][disco-event-worker-#19989%hadoop.HadoopMapReduceEmbeddedSelfTest0%][GridDiscoveryManager]
> Topology snapshot [ver=3, nodes=3, CPUs=4, heap=2.8GB]
> [16:37:42,600][INFO
> ][disco-event-worker-#20066%hadoop.HadoopMapReduceEmbeddedSelfTest1%][GridDiscoveryManager]
> Added new node to topology: TcpDiscoveryNode
> [id=d313c493-0cbc-4ada-a03e-e48802166818, addrs=[127.0.0.1],
> sockAddrs=[/127.0.0.1:47502], discPort=47502, order=3, intOrder=3, loc=false,
> ver=1.0.0#19700101-sha1:00000000, isClient=false]
> [16:37:42,600][INFO
> ][disco-event-worker-#20066%hadoop.HadoopMapReduceEmbeddedSelfTest1%][GridDiscoveryManager]
> Topology snapshot [ver=3, nodes=3, CPUs=4, heap=2.8GB]
> [16:37:42,612][INFO ][main][GridCacheProcessor] Started cache
> [name=ignite-marshaller-sys-cache, mode=REPLICATED]
> [16:37:42,617][INFO ][main][GridCacheProcessor] Started cache [name=meta,
> mode=REPLICATED]
> [16:37:42,623][INFO ][main][GridCacheProcessor] Started cache
> [name=ignite-hadoop-mr-sys-cache, mode=REPLICATED]
> [16:37:42,632][INFO ][main][GridCacheProcessor] Started cache
> [name=ignite-atomics-sys-cache, mode=PARTITIONED]
> [16:37:42,639][INFO ][main][GridCacheProcessor] Started cache [name=data,
> mode=PARTITIONED]
> [16:37:42,644][INFO ][main][GridCacheProcessor] Started cache
> [name=ignite-sys-cache, mode=REPLICATED]
> [16:37:43,306][INFO ][main][GridDhtPreloader] <ignite-marshaller-sys-cache>
> Starting rebalancing in SYNC mode: ignite-marshaller-sys-cache
> [16:37:43,306][INFO ][main][GridDhtPreloader] <ignite-hadoop-mr-sys-cache>
> Starting rebalancing in SYNC mode: ignite-hadoop-mr-sys-cache
> [16:37:43,306][INFO ][main][GridDhtPreloader] <meta> Starting rebalancing in
> ASYNC mode: meta
> [16:37:43,307][INFO ][main][GridDhtPreloader] <ignite-atomics-sys-cache>
> Starting rebalancing in SYNC mode: ignite-atomics-sys-cache
> [16:37:43,308][INFO ][main][GridDhtPreloader] <data> Starting rebalancing in
> ASYNC mode: data
> [16:37:43,308][INFO ][main][GridDhtPreloader] <ignite-sys-cache> Starting
> rebalancing in SYNC mode: ignite-sys-cache
> [16:37:43,476][INFO
> ][preloader-demand-worker-#20167%hadoop.HadoopMapReduceEmbeddedSelfTest2%][GridDhtPreloader]
> <ignite-marshaller-sys-cache> Completed rebalancing in SYNC mode
> [cache=ignite-marshaller-sys-cache, time=171 ms]
> [16:37:43,496][INFO
> ][preloader-demand-worker-#20181%hadoop.HadoopMapReduceEmbeddedSelfTest2%][GridDhtPreloader]
> <ignite-atomics-sys-cache> Completed rebalancing in SYNC mode
> [cache=ignite-atomics-sys-cache, time=193 ms]
> [16:37:43,500][INFO
> ][preloader-demand-worker-#20193%hadoop.HadoopMapReduceEmbeddedSelfTest2%][GridDhtPreloader]
> <ignite-sys-cache> Completed rebalancing in SYNC mode
> [cache=ignite-sys-cache, time=193 ms]
> [16:37:43,505][INFO
> ][preloader-demand-worker-#20188%hadoop.HadoopMapReduceEmbeddedSelfTest2%][GridDhtPreloader]
> <data> Completed rebalancing in ASYNC mode [cache=data, time=193 ms]
> [16:37:43,520][INFO
> ][preloader-demand-worker-#20173%hadoop.HadoopMapReduceEmbeddedSelfTest2%][GridDhtPreloader]
> <ignite-hadoop-mr-sys-cache> Completed rebalancing in SYNC mode
> [cache=ignite-hadoop-mr-sys-cache, time=213 ms]
> [16:37:43,525][INFO
> ][preloader-demand-worker-#20178%hadoop.HadoopMapReduceEmbeddedSelfTest2%][GridDhtPreloader]
> <meta> Completed rebalancing in ASYNC mode [cache=meta, time=213 ms]
> [16:37:43,548][INFO ][main][HadoopMapReduceEmbeddedSelfTest2] Performance
> suggestions for grid 'hadoop.HadoopMapReduceEmbeddedSelfTest2' (fix if
> possible)
> [16:37:43,548][INFO ][main][HadoopMapReduceEmbeddedSelfTest2] To disable, set
> -DIGNITE_PERFORMANCE_SUGGESTIONS_DISABLED=true
> [16:37:43,548][INFO ][main][HadoopMapReduceEmbeddedSelfTest2] ^-- Disable
> checkpoints (remove 'checkpointSpi' from configuration)
> [16:37:43,548][INFO ][main][HadoopMapReduceEmbeddedSelfTest2] ^-- Disable
> grid events (remove 'includeEventTypes' from configuration)
> [16:37:43,548][INFO ][main][HadoopMapReduceEmbeddedSelfTest2]
> [16:37:43,548][INFO ][main][HadoopMapReduceEmbeddedSelfTest2] To start
> Console Management & Monitoring run ignitevisorcmd.{sh|bat}
> [16:37:43,548][INFO ][main][HadoopMapReduceEmbeddedSelfTest2]
> [16:37:43,548][INFO ][main][HadoopMapReduceEmbeddedSelfTest2]
> >>> +---------------------------------+
> >>> Ignite ver. 1.0.0#19700101-sha1:DEV
> >>> +---------------------------------+
> >>> OS name: Linux 2.6.32-38-generic amd64
> >>> CPU(s): 4
> >>> Heap: 2.8GB
> >>> VM name: 21398@gg-teamcity-7
> >>> Grid name: hadoop.HadoopMapReduceEmbeddedSelfTest2
> >>> Local node [ID=D313C493-0CBC-4ADA-A03E-E48802166818, order=3]
> >>> Local node addresses: [/127.0.0.1]
> >>> Local ports: TCP:45192 TCP:47502
> >>> Ignite documentation: http://ignite.incubator.apache.org
> [16:37:43,549][INFO ][main][GridDiscoveryManager] Topology snapshot [ver=3,
> nodes=3, CPUs=4, heap=2.8GB]
> [16:37:44,371][INFO ][test-runner][FileInputFormat] Total input paths to
> process : 1
> [16:38:34,058][INFO
> ][Hadoop-task-3642bd08-a856-457f-b7de-1eaabc4de4da_1-REDUCE-0-0-#20618%hadoop.HadoopMapReduceEmbeddedSelfTest0%][FileOutputCommitter]
> Saved output of task
> 'attempt_3642bd08-a856-457f-b7de-1eaabc4de4da_0001_r_000000_0' to
> igfs://:hadoop.HadoopMapReduceEmbeddedSelfTest0@/output/_temporary/0/task_3642bd08-a856-457f-b7de-1eaabc4de4da_0001_r_000000
> [16:38:35,397][INFO ][test-runner][FileInputFormat] Total input paths to
> process : 1
> [16:39:25,057][INFO
> ][Hadoop-task-afecac89-ef45-4a3d-988c-c5c16f231d52_1-REDUCE-0-0-#20969%hadoop.HadoopMapReduceEmbeddedSelfTest0%][FileOutputCommitter]
> Saved output of task
> 'attempt_afecac89-ef45-4a3d-988c-c5c16f231d52_0001_r_000000_0' to
> igfs://:hadoop.HadoopMapReduceEmbeddedSelfTest0@/output/_temporary/0/task_afecac89-ef45-4a3d-988c-c5c16f231d52_0001_r_000000
> [16:39:26,206][INFO ][test-runner][FileInputFormat] Total input paths to
> process : 1
> [16:40:16,204][INFO
> ][Hadoop-task-5a132c34-b235-4468-8c4c-70e4bc047897_1-REDUCE-0-0-#21316%hadoop.HadoopMapReduceEmbeddedSelfTest0%][FileOutputCommitter]
> Saved output of task
> 'attempt_5a132c34-b235-4468-8c4c-70e4bc047897_0001_r_000000_0' to
> igfs://:hadoop.HadoopMapReduceEmbeddedSelfTest0@/output/_temporary/0/task_5a132c34-b235-4468-8c4c-70e4bc047897_0001_r_000000
> [16:40:17,783][INFO ][test-runner][FileInputFormat] Total input paths to
> process : 1
> [16:41:07,878][INFO
> ][Hadoop-task-37d89f9d-7bf4-4bfc-acfe-8bdf2dfec0c1_1-REDUCE-0-0-#21663%hadoop.HadoopMapReduceEmbeddedSelfTest0%][FileOutputCommitter]
> Saved output of task
> 'attempt_37d89f9d-7bf4-4bfc-acfe-8bdf2dfec0c1_0001_r_000000_0' to
> igfs://:hadoop.HadoopMapReduceEmbeddedSelfTest0@/output/_temporary/0/task_37d89f9d-7bf4-4bfc-acfe-8bdf2dfec0c1_0001_r_000000
> [16:41:09,319][INFO ][test-runner][FileInputFormat] Total input paths to
> process : 1
> [16:41:59,352][INFO
> ][Hadoop-task-e9089c34-7864-412e-9507-2038b6fb0d6e_1-REDUCE-0-0-#22010%hadoop.HadoopMapReduceEmbeddedSelfTest0%][FileOutputCommitter]
> Saved output of task
> 'attempt_e9089c34-7864-412e-9507-2038b6fb0d6e_0001_r_000000_0' to
> igfs://:hadoop.HadoopMapReduceEmbeddedSelfTest0@/output/_temporary/0/task_e9089c34-7864-412e-9507-2038b6fb0d6e_0001_r_000000
> [16:42:01,014][INFO ][test-runner][FileInputFormat] Total input paths to
> process : 1
> [16:42:39,194][INFO
> ][Hadoop-task-b42447f3-7f75-4639-864f-72854bb81982_1-REDUCE-0-0-#22357%hadoop.HadoopMapReduceEmbeddedSelfTest0%][FileOutputCommitter]
> Saved output of task
> 'attempt_b42447f3-7f75-4639-864f-72854bb81982_0001_r_000000_0' to
> igfs://:hadoop.HadoopMapReduceEmbeddedSelfTest0@/output/_temporary/0/task_b42447f3-7f75-4639-864f-72854bb81982_0001_r_000000
> [16:42:40,250][INFO ][test-runner][FileInputFormat] Total input paths to
> process : 1
> [16:42:43] (wrn) Thread dump at 2015/03/27 16:42:43 MSK
> Thread
> [name="Hadoop-task-ef8347bb-a9de-454a-8823-60e3b3c513b7_1-MAP-232-0-#22374%hadoop.HadoopMapReduceEmbeddedSelfTest2%",
> id=30879, state=RUNNABLE, blockCnt=0, waitCnt=4]
> at java.util.StringTokenizer.skipDelimiters(StringTokenizer.java:245)
> at java.util.StringTokenizer.hasMoreTokens(StringTokenizer.java:323)
> at
> o.a.i.i.processors.hadoop.examples.HadoopWordCount2Mapper.map(HadoopWordCount2Mapper.java:50)
> at
> o.a.i.i.processors.hadoop.examples.HadoopWordCount2Mapper.map(HadoopWordCount2Mapper.java:30)
> at org.apache.hadoop.mapreduce.Mapper.run(Mapper.java:145)
> at
> o.a.i.i.processors.hadoop.v2.HadoopV2MapTask.run0(HadoopV2MapTask.java:84)
> at o.a.i.i.processors.hadoop.v2.HadoopV2Task.run(HadoopV2Task.java:50)
> at
> o.a.i.i.processors.hadoop.v2.HadoopV2TaskContext.run(HadoopV2TaskContext.java:193)
> at
> o.a.i.i.processors.hadoop.taskexecutor.HadoopRunnableTask.runTask(HadoopRunnableTask.java:176)
> at
> o.a.i.i.processors.hadoop.taskexecutor.HadoopRunnableTask.call(HadoopRunnableTask.java:120)
> at
> o.a.i.i.processors.hadoop.taskexecutor.HadoopRunnableTask.call(HadoopRunnableTask.java:36)
> at
> o.a.i.i.processors.hadoop.taskexecutor.HadoopExecutorService$2.body(HadoopExecutorService.java:183)
> at o.a.i.i.util.worker.GridWorker.run(GridWorker.java:107)
> at java.lang.Thread.run(Thread.java:745)
> Thread
> [name="hadoop-shuffle-ef8347bb-a9de-454a-8823-60e3b3c513b7_1-#22373%hadoop.HadoopMapReduceEmbeddedSelfTest2%",
> id=30878, state=TIMED_WAITING, blockCnt=0, waitCnt=28]
> at java.lang.Thread.sleep(Native Method)
> at
> o.a.i.i.processors.hadoop.shuffle.HadoopShuffleJob$1.body(HadoopShuffleJob.java:159)
> at o.a.i.i.util.worker.GridWorker.run(GridWorker.java:107)
> at java.lang.Thread.run(Thread.java:745)
> Thread
> [name="Hadoop-task-ef8347bb-a9de-454a-8823-60e3b3c513b7_1-MAP-5-0-#22372%hadoop.HadoopMapReduceEmbeddedSelfTest0%",
> id=30877, state=RUNNABLE, blockCnt=0, waitCnt=6]
> at org.apache.hadoop.io.Text.readFields(Text.java:291)
> at
> o.a.i.i.processors.hadoop.v2.HadoopWritableSerialization.read(HadoopWritableSerialization.java:61)
> at
> o.a.i.i.processors.hadoop.shuffle.collections.HadoopMultimapBase$ReaderBase.read(HadoopMultimapBase.java:159)
> at
> o.a.i.i.processors.hadoop.shuffle.collections.HadoopSkipList$Reader.readKey(HadoopSkipList.java:260)
> at
> o.a.i.i.processors.hadoop.shuffle.collections.HadoopSkipList$AdderImpl.cmp(HadoopSkipList.java:471)
> at
> o.a.i.i.processors.hadoop.shuffle.collections.HadoopSkipList$AdderImpl.add(HadoopSkipList.java:417)
> at
> o.a.i.i.processors.hadoop.shuffle.collections.HadoopSkipList$AdderImpl.write(HadoopSkipList.java:300)
> at
> o.a.i.i.processors.hadoop.v2.HadoopV2Context.write(HadoopV2Context.java:134)
> at
> org.apache.hadoop.mapreduce.lib.map.WrappedMapper$Context.write(WrappedMapper.java:112)
> at
> o.a.i.i.processors.hadoop.examples.HadoopWordCount2Mapper.map(HadoopWordCount2Mapper.java:53)
> at
> o.a.i.i.processors.hadoop.examples.HadoopWordCount2Mapper.map(HadoopWordCount2Mapper.java:30)
> at org.apache.hadoop.mapreduce.Mapper.run(Mapper.java:145)
> at
> o.a.i.i.processors.hadoop.v2.HadoopV2MapTask.run0(HadoopV2MapTask.java:84)
> at o.a.i.i.processors.hadoop.v2.HadoopV2Task.run(HadoopV2Task.java:50)
> at
> o.a.i.i.processors.hadoop.v2.HadoopV2TaskContext.run(HadoopV2TaskContext.java:193)
> at
> o.a.i.i.processors.hadoop.taskexecutor.HadoopRunnableTask.runTask(HadoopRunnableTask.java:176)
> at
> o.a.i.i.processors.hadoop.taskexecutor.HadoopRunnableTask.call(HadoopRunnableTask.java:120)
> at
> o.a.i.i.processors.hadoop.taskexecutor.HadoopRunnableTask.call(HadoopRunnableTask.java:36)
> at
> o.a.i.i.processors.hadoop.taskexecutor.HadoopExecutorService$2.body(HadoopExecutorService.java:183)
> at o.a.i.i.util.worker.GridWorker.run(GridWorker.java:107)
> at java.lang.Thread.run(Thread.java:745)
> ......
--
This message was sent by Atlassian JIRA
(v6.3.4#6332)
