lucene-dev mailing list archives

Site index · List index
Message view « Date » · « Thread »
Top « Date » · « Thread »
From Policeman Jenkins Server <jenk...@sd-datasolutions.de>
Subject [JENKINS] Lucene-Solr-trunk-Linux (64bit/jdk1.7.0_07) - Build # 1644 - Failure!
Date Tue, 09 Oct 2012 08:17:48 GMT
Build: http://jenkins.sd-datasolutions.de/job/Lucene-Solr-trunk-Linux/1644/
Java: 64bit/jdk1.7.0_07 -XX:+UseG1GC

1 tests failed.
REGRESSION:  org.apache.solr.cloud.RecoveryZkTest.testDistribSearch

Error Message:
Server at http://127.0.0.1:51813/solr/collection1 returned non ok status:404, message:Can not find: /solr/collection1/select

Stack Trace:
org.apache.solr.common.SolrException: Server at http://127.0.0.1:51813/solr/collection1 returned non ok status:404, message:Can not find: /solr/collection1/select
	at __randomizedtesting.SeedInfo.seed([C7FC3171220FD5FC:461ABF695550B5C0]:0)
	at org.apache.solr.client.solrj.impl.HttpSolrServer.request(HttpSolrServer.java:372)
	at org.apache.solr.client.solrj.impl.HttpSolrServer.request(HttpSolrServer.java:181)
	at org.apache.solr.client.solrj.request.QueryRequest.process(QueryRequest.java:90)
	at org.apache.solr.client.solrj.SolrServer.query(SolrServer.java:301)
	at org.apache.solr.cloud.RecoveryZkTest.doTest(RecoveryZkTest.java:92)
	at org.apache.solr.BaseDistributedSearchTestCase.testDistribSearch(BaseDistributedSearchTestCase.java:695)
	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:601)
	at com.carrotsearch.randomizedtesting.RandomizedRunner.invoke(RandomizedRunner.java:1559)
	at com.carrotsearch.randomizedtesting.RandomizedRunner.access$600(RandomizedRunner.java:79)
	at com.carrotsearch.randomizedtesting.RandomizedRunner$6.evaluate(RandomizedRunner.java:737)
	at com.carrotsearch.randomizedtesting.RandomizedRunner$7.evaluate(RandomizedRunner.java:773)
	at com.carrotsearch.randomizedtesting.RandomizedRunner$8.evaluate(RandomizedRunner.java:787)
	at com.carrotsearch.randomizedtesting.rules.SystemPropertiesRestoreRule$1.evaluate(SystemPropertiesRestoreRule.java:53)
	at org.apache.lucene.util.TestRuleSetupTeardownChained$1.evaluate(TestRuleSetupTeardownChained.java:50)
	at org.apache.lucene.util.TestRuleFieldCacheSanity$1.evaluate(TestRuleFieldCacheSanity.java:51)
	at org.apache.lucene.util.AbstractBeforeAfterRule$1.evaluate(AbstractBeforeAfterRule.java:45)
	at com.carrotsearch.randomizedtesting.rules.SystemPropertiesInvariantRule$1.evaluate(SystemPropertiesInvariantRule.java:55)
	at org.apache.lucene.util.TestRuleThreadAndTestName$1.evaluate(TestRuleThreadAndTestName.java:48)
	at org.apache.lucene.util.TestRuleIgnoreAfterMaxFailures$1.evaluate(TestRuleIgnoreAfterMaxFailures.java:70)
	at org.apache.lucene.util.TestRuleMarkFailure$1.evaluate(TestRuleMarkFailure.java:48)
	at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
	at com.carrotsearch.randomizedtesting.ThreadLeakControl$StatementRunner.run(ThreadLeakControl.java:358)
	at com.carrotsearch.randomizedtesting.ThreadLeakControl.forkTimeoutingTask(ThreadLeakControl.java:782)
	at com.carrotsearch.randomizedtesting.ThreadLeakControl$3.evaluate(ThreadLeakControl.java:442)
	at com.carrotsearch.randomizedtesting.RandomizedRunner.runSingleTest(RandomizedRunner.java:746)
	at com.carrotsearch.randomizedtesting.RandomizedRunner$3.evaluate(RandomizedRunner.java:648)
	at com.carrotsearch.randomizedtesting.RandomizedRunner$4.evaluate(RandomizedRunner.java:682)
	at com.carrotsearch.randomizedtesting.RandomizedRunner$5.evaluate(RandomizedRunner.java:693)
	at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
	at com.carrotsearch.randomizedtesting.rules.SystemPropertiesRestoreRule$1.evaluate(SystemPropertiesRestoreRule.java:53)
	at org.apache.lucene.util.AbstractBeforeAfterRule$1.evaluate(AbstractBeforeAfterRule.java:45)
	at org.apache.lucene.util.TestRuleStoreClassName$1.evaluate(TestRuleStoreClassName.java:42)
	at com.carrotsearch.randomizedtesting.rules.SystemPropertiesInvariantRule$1.evaluate(SystemPropertiesInvariantRule.java:55)
	at com.carrotsearch.randomizedtesting.rules.NoShadowingOrOverridesOnMethodsRule$1.evaluate(NoShadowingOrOverridesOnMethodsRule.java:39)
	at com.carrotsearch.randomizedtesting.rules.NoShadowingOrOverridesOnMethodsRule$1.evaluate(NoShadowingOrOverridesOnMethodsRule.java:39)
	at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
	at org.apache.lucene.util.TestRuleAssertionsRequired$1.evaluate(TestRuleAssertionsRequired.java:43)
	at org.apache.lucene.util.TestRuleMarkFailure$1.evaluate(TestRuleMarkFailure.java:48)
	at org.apache.lucene.util.TestRuleIgnoreAfterMaxFailures$1.evaluate(TestRuleIgnoreAfterMaxFailures.java:70)
	at org.apache.lucene.util.TestRuleIgnoreTestSuites$1.evaluate(TestRuleIgnoreTestSuites.java:55)
	at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
	at com.carrotsearch.randomizedtesting.ThreadLeakControl$StatementRunner.run(ThreadLeakControl.java:358)
	at java.lang.Thread.run(Thread.java:722)




Build Log:
[...truncated 8431 lines...]
[junit4:junit4] Suite: org.apache.solr.cloud.RecoveryZkTest
[junit4:junit4]   2> 4 T202 oas.SolrTestCaseJ4.setUp ###Starting testDistribSearch
[junit4:junit4]   2> Creating dataDir: /mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build/solr-core/test/J1/./solrtest-RecoveryZkTest-1349770199433
[junit4:junit4]   2> 7 T202 oasc.ZkTestServer.run STARTING ZK TEST SERVER
[junit4:junit4]   2> 47 T203 oaz.Environment.logEnv Server environment:zookeeper.version=3.3.6-1366786, built on 07/29/2012 06:22 GMT
[junit4:junit4]   2> 48 T203 oaz.Environment.logEnv Server environment:host.name=serv1
[junit4:junit4]   2> 48 T203 oaz.Environment.logEnv Server environment:java.version=1.7.0_07
[junit4:junit4]   2> 48 T203 oaz.Environment.logEnv Server environment:java.vendor=Oracle Corporation
[junit4:junit4]   2> 48 T203 oaz.Environment.logEnv Server environment:java.home=/mnt/ssd/jenkins/tools/java/64bit/jdk1.7.0_07/jre
[junit4:junit4]   2> 48 T203 oaz.Environment.logEnv Server environment:java.class.path=/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build/solr-core/classes/test:/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build/solr-test-framework/classes/java:/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build/solr-core/test-files:/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/lucene/build/codecs/classes/java:/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/lucene/build/test-framework/classes/java:/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build/solr-solrj/classes/java:/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build/solr-core/classes/java:/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/lucene/build/analysis/common/lucene-analyzers-common-5.0-SNAPSHOT.jar:/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/lucene/build/analysis/kuromoji/lucene-analyzers-kuromoji-5.0-SNAPSHOT.jar:/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/lucene/build/analysis/phonetic/lucene-analyzers-phonetic-5.0-SNAPSHOT.jar:/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/lucene/build/highlighter/lucene-highlighter-5.0-SNAPSHOT.jar:/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/lucene/build/memory/lucene-memory-5.0-SNAPSHOT.jar:/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/lucene/build/misc/lucene-misc-5.0-SNAPSHOT.jar:/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/lucene/build/spatial/lucene-spatial-5.0-SNAPSHOT.jar:/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/lucene/build/suggest/lucene-suggest-5.0-SNAPSHOT.jar:/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/lucene/build/grouping/lucene-grouping-5.0-SNAPSHOT.jar:/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/lucene/build/queries/lucene-queries-5.0-SNAPSHOT.jar:/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/lucene/build/queryparser/lucene-queryparser-5.0-SNAPSHOT.jar:/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/core/lib/commons-cli-1.2.jar:/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/core/lib/commons-codec-1.7.jar:/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/core/lib/commons-fileupload-1.2.1.jar:/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/core/lib/commons-lang-2.6.jar:/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/core/lib/easymock-2.2.jar:/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/core/lib/guava-r05.jar:/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/core/lib/javax.servlet-api-3.0.1.jar:/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/core/lib/spatial4j-0.3.jar:/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/solrj/lib/commons-io-2.1.jar:/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/solrj/lib/httpclient-4.1.3.jar:/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/solrj/lib/httpcore-4.1.4.jar:/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/solrj/lib/httpmime-4.1.3.jar:/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/solrj/lib/jcl-over-slf4j-1.6.4.jar:/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/solrj/lib/log4j-over-slf4j-1.6.4.jar:/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/solrj/lib/slf4j-api-1.6.4.jar:/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/solrj/lib/slf4j-jdk14-1.6.4.jar:/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/solrj/lib/wstx-asl-3.2.7.jar:/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/solrj/lib/zookeeper-3.3.6.jar:/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/example/lib/jetty-continuation-8.1.2.v20120308.jar:/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/example/lib/jetty-deploy-8.1.2.v20120308.jar:/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/example/lib/jetty-http-8.1.2.v20120308.jar:/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/example/lib/jetty-io-8.1.2.v20120308.jar:/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/example/lib/jetty-jmx-8.1.2.v20120308.jar:/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/example/lib/jetty-security-8.1.2.v20120308.jar:/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/example/lib/jetty-server-8.1.2.v20120308.jar:/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/example/lib/jetty-servlet-8.1.2.v20120308.jar:/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/example/lib/jetty-util-8.1.2.v20120308.jar:/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/example/lib/jetty-webapp-8.1.2.v20120308.jar:/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/example/lib/jetty-xml-8.1.2.v20120308.jar:/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/example/lib/servlet-api-3.0.jar:/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/example/example-DIH/solr/db/lib/hsqldb-1.8.0.10.jar:/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/lucene/build/core/classes/java:/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/lucene/test-framework/lib/junit-4.10.jar:/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/lucene/test-framework/lib/randomizedtesting-runner-2.0.3.jar:/var/lib/jenkins/tools/Ant/ANT_1.8.2/lib/ant-launcher.jar:/var/lib/jenkins/.ant/lib/ivy-2.2.0.jar:/var/lib/jenkins/tools/Ant/ANT_1.8.2/lib/ant-jdepend.jar:/var/lib/jenkins/tools/Ant/ANT_1.8.2/lib/ant-netrexx.jar:/var/lib/jenkins/tools/Ant/ANT_1.8.2/lib/ant-antlr.jar:/var/lib/jenkins/tools/Ant/ANT_1.8.2/lib/ant-commons-net.jar:/var/lib/jenkins/tools/Ant/ANT_1.8.2/lib/ant-javamail.jar:/var/lib/jenkins/tools/Ant/ANT_1.8.2/lib/ant-apache-regexp.jar:/var/lib/jenkins/tools/Ant/ANT_1.8.2/lib/ant-jsch.jar:/var/lib/jenkins/tools/Ant/ANT_1.8.2/lib/ant-apache-xalan2.jar:/var/lib/jenkins/tools/Ant/ANT_1.8.2/lib/ant-junit4.jar:/var/lib/jenkins/tools/Ant/ANT_1.8.2/lib/ant-jmf.jar:/var/lib/jenkins/tools/Ant/ANT_1.8.2/lib/ant.jar:/var/lib/jenkins/tools/Ant/ANT_1.8.2/lib/ant-junit.jar:/var/lib/jenkins/tools/Ant/ANT_1.8.2/lib/ant-apache-bcel.jar:/var/lib/jenkins/tools/Ant/ANT_1.8.2/lib/ant-jai.jar:/var/lib/jenkins/tools/Ant/ANT_1.8.2/lib/ant-commons-logging.jar:/var/lib/jenkins/tools/Ant/ANT_1.8.2/lib/ant-apache-resolver.jar:/var/lib/jenkins/tools/Ant/ANT_1.8.2/lib/ant-apache-oro.jar:/var/lib/jenkins/tools/Ant/ANT_1.8.2/lib/ant-swing.jar:/var/lib/jenkins/tools/Ant/ANT_1.8.2/lib/ant-apache-bsf.jar:/var/lib/jenkins/tools/Ant/ANT_1.8.2/lib/ant-apache-log4j.jar:/var/lib/jenkins/tools/Ant/ANT_1.8.2/lib/ant-testutil.jar:/mnt/ssd/jenkins/tools/java/64bit/jdk1.7.0_07/lib/tools.jar:/var/lib/jenkins/.ivy2/cache/com.carrotsearch.randomizedtesting/junit4-ant/jars/junit4-ant-2.0.3.jar
[junit4:junit4]   2> 49 T203 oaz.Environment.logEnv Server environment:java.library.path=/mnt/ssd/jenkins/tools/java/64bit/jdk1.7.0_07/jre/lib/amd64/server:/mnt/ssd/jenkins/tools/java/64bit/jdk1.7.0_07/jre/lib/amd64:/mnt/ssd/jenkins/tools/java/64bit/jdk1.7.0_07/jre/../lib/amd64:/usr/lib/jvm/j2sdk1.6-sun/jre/lib/amd64/server:/usr/lib/jvm/j2sdk1.6-sun/jre/lib/amd64:/usr/lib/jvm/j2sdk1.6-sun/jre/../lib/amd64:/usr/java/packages/lib/amd64:/usr/lib64:/lib64:/lib:/usr/lib
[junit4:junit4]   2> 49 T203 oaz.Environment.logEnv Server environment:java.io.tmpdir=.
[junit4:junit4]   2> 49 T203 oaz.Environment.logEnv Server environment:java.compiler=<NA>
[junit4:junit4]   2> 49 T203 oaz.Environment.logEnv Server environment:os.name=Linux
[junit4:junit4]   2> 50 T203 oaz.Environment.logEnv Server environment:os.arch=amd64
[junit4:junit4]   2> 50 T203 oaz.Environment.logEnv Server environment:os.version=3.2.0-31-generic
[junit4:junit4]   2> 50 T203 oaz.Environment.logEnv Server environment:user.name=jenkins
[junit4:junit4]   2> 50 T203 oaz.Environment.logEnv Server environment:user.home=/var/lib/jenkins
[junit4:junit4]   2> 50 T203 oaz.Environment.logEnv Server environment:user.dir=/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build/solr-core/test/J1
[junit4:junit4]   2> 64 T203 oazs.ZooKeeperServer.setTickTime tickTime set to 1000
[junit4:junit4]   2> 81 T203 oazs.NIOServerCnxn$Factory.<init> binding to port 0.0.0.0/0.0.0.0:0
[junit4:junit4]   2> 101 T203 oazsp.FileTxnSnapLog.save Snapshotting: 0
[junit4:junit4]   2> 109 T202 oasc.ZkTestServer.run start zk server on port:48755
[junit4:junit4]   2> 136 T202 oaz.Environment.logEnv Client environment:zookeeper.version=3.3.6-1366786, built on 07/29/2012 06:22 GMT
[junit4:junit4]   2> 136 T202 oaz.Environment.logEnv Client environment:host.name=serv1
[junit4:junit4]   2> 137 T202 oaz.Environment.logEnv Client environment:java.version=1.7.0_07
[junit4:junit4]   2> 137 T202 oaz.Environment.logEnv Client environment:java.vendor=Oracle Corporation
[junit4:junit4]   2> 138 T202 oaz.Environment.logEnv Client environment:java.home=/mnt/ssd/jenkins/tools/java/64bit/jdk1.7.0_07/jre
[junit4:junit4]   2> 138 T202 oaz.Environment.logEnv Client environment:java.class.path=/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build/solr-core/classes/test:/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build/solr-test-framework/classes/java:/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build/solr-core/test-files:/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/lucene/build/codecs/classes/java:/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/lucene/build/test-framework/classes/java:/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build/solr-solrj/classes/java:/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build/solr-core/classes/java:/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/lucene/build/analysis/common/lucene-analyzers-common-5.0-SNAPSHOT.jar:/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/lucene/build/analysis/kuromoji/lucene-analyzers-kuromoji-5.0-SNAPSHOT.jar:/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/lucene/build/analysis/phonetic/lucene-analyzers-phonetic-5.0-SNAPSHOT.jar:/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/lucene/build/highlighter/lucene-highlighter-5.0-SNAPSHOT.jar:/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/lucene/build/memory/lucene-memory-5.0-SNAPSHOT.jar:/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/lucene/build/misc/lucene-misc-5.0-SNAPSHOT.jar:/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/lucene/build/spatial/lucene-spatial-5.0-SNAPSHOT.jar:/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/lucene/build/suggest/lucene-suggest-5.0-SNAPSHOT.jar:/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/lucene/build/grouping/lucene-grouping-5.0-SNAPSHOT.jar:/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/lucene/build/queries/lucene-queries-5.0-SNAPSHOT.jar:/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/lucene/build/queryparser/lucene-queryparser-5.0-SNAPSHOT.jar:/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/core/lib/commons-cli-1.2.jar:/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/core/lib/commons-codec-1.7.jar:/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/core/lib/commons-fileupload-1.2.1.jar:/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/core/lib/commons-lang-2.6.jar:/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/core/lib/easymock-2.2.jar:/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/core/lib/guava-r05.jar:/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/core/lib/javax.servlet-api-3.0.1.jar:/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/core/lib/spatial4j-0.3.jar:/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/solrj/lib/commons-io-2.1.jar:/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/solrj/lib/httpclient-4.1.3.jar:/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/solrj/lib/httpcore-4.1.4.jar:/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/solrj/lib/httpmime-4.1.3.jar:/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/solrj/lib/jcl-over-slf4j-1.6.4.jar:/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/solrj/lib/log4j-over-slf4j-1.6.4.jar:/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/solrj/lib/slf4j-api-1.6.4.jar:/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/solrj/lib/slf4j-jdk14-1.6.4.jar:/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/solrj/lib/wstx-asl-3.2.7.jar:/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/solrj/lib/zookeeper-3.3.6.jar:/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/example/lib/jetty-continuation-8.1.2.v20120308.jar:/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/example/lib/jetty-deploy-8.1.2.v20120308.jar:/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/example/lib/jetty-http-8.1.2.v20120308.jar:/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/example/lib/jetty-io-8.1.2.v20120308.jar:/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/example/lib/jetty-jmx-8.1.2.v20120308.jar:/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/example/lib/jetty-security-8.1.2.v20120308.jar:/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/example/lib/jetty-server-8.1.2.v20120308.jar:/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/example/lib/jetty-servlet-8.1.2.v20120308.jar:/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/example/lib/jetty-util-8.1.2.v20120308.jar:/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/example/lib/jetty-webapp-8.1.2.v20120308.jar:/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/example/lib/jetty-xml-8.1.2.v20120308.jar:/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/example/lib/servlet-api-3.0.jar:/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/example/example-DIH/solr/db/lib/hsqldb-1.8.0.10.jar:/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/lucene/build/core/classes/java:/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/lucene/test-framework/lib/junit-4.10.jar:/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/lucene/test-framework/lib/randomizedtesting-runner-2.0.3.jar:/var/lib/jenkins/tools/Ant/ANT_1.8.2/lib/ant-launcher.jar:/var/lib/jenkins/.ant/lib/ivy-2.2.0.jar:/var/lib/jenkins/tools/Ant/ANT_1.8.2/lib/ant-jdepend.jar:/var/lib/jenkins/tools/Ant/ANT_1.8.2/lib/ant-netrexx.jar:/var/lib/jenkins/tools/Ant/ANT_1.8.2/lib/ant-antlr.jar:/var/lib/jenkins/tools/Ant/ANT_1.8.2/lib/ant-commons-net.jar:/var/lib/jenkins/tools/Ant/ANT_1.8.2/lib/ant-javamail.jar:/var/lib/jenkins/tools/Ant/ANT_1.8.2/lib/ant-apache-regexp.jar:/var/lib/jenkins/tools/Ant/ANT_1.8.2/lib/ant-jsch.jar:/var/lib/jenkins/tools/Ant/ANT_1.8.2/lib/ant-apache-xalan2.jar:/var/lib/jenkins/tools/Ant/ANT_1.8.2/lib/ant-junit4.jar:/var/lib/jenkins/tools/Ant/ANT_1.8.2/lib/ant-jmf.jar:/var/lib/jenkins/tools/Ant/ANT_1.8.2/lib/ant.jar:/var/lib/jenkins/tools/Ant/ANT_1.8.2/lib/ant-junit.jar:/var/lib/jenkins/tools/Ant/ANT_1.8.2/lib/ant-apache-bcel.jar:/var/lib/jenkins/tools/Ant/ANT_1.8.2/lib/ant-jai.jar:/var/lib/jenkins/tools/Ant/ANT_1.8.2/lib/ant-commons-logging.jar:/var/lib/jenkins/tools/Ant/ANT_1.8.2/lib/ant-apache-resolver.jar:/var/lib/jenkins/tools/Ant/ANT_1.8.2/lib/ant-apache-oro.jar:/var/lib/jenkins/tools/Ant/ANT_1.8.2/lib/ant-swing.jar:/var/lib/jenkins/tools/Ant/ANT_1.8.2/lib/ant-apache-bsf.jar:/var/lib/jenkins/tools/Ant/ANT_1.8.2/lib/ant-apache-log4j.jar:/var/lib/jenkins/tools/Ant/ANT_1.8.2/lib/ant-testutil.jar:/mnt/ssd/jenkins/tools/java/64bit/jdk1.7.0_07/lib/tools.jar:/var/lib/jenkins/.ivy2/cache/com.carrotsearch.randomizedtesting/junit4-ant/jars/junit4-ant-2.0.3.jar
[junit4:junit4]   2> 139 T202 oaz.Environment.logEnv Client environment:java.library.path=/mnt/ssd/jenkins/tools/java/64bit/jdk1.7.0_07/jre/lib/amd64/server:/mnt/ssd/jenkins/tools/java/64bit/jdk1.7.0_07/jre/lib/amd64:/mnt/ssd/jenkins/tools/java/64bit/jdk1.7.0_07/jre/../lib/amd64:/usr/lib/jvm/j2sdk1.6-sun/jre/lib/amd64/server:/usr/lib/jvm/j2sdk1.6-sun/jre/lib/amd64:/usr/lib/jvm/j2sdk1.6-sun/jre/../lib/amd64:/usr/java/packages/lib/amd64:/usr/lib64:/lib64:/lib:/usr/lib
[junit4:junit4]   2> 140 T202 oaz.Environment.logEnv Client environment:java.io.tmpdir=.
[junit4:junit4]   2> 140 T202 oaz.Environment.logEnv Client environment:java.compiler=<NA>
[junit4:junit4]   2> 140 T202 oaz.Environment.logEnv Client environment:os.name=Linux
[junit4:junit4]   2> 141 T202 oaz.Environment.logEnv Client environment:os.arch=amd64
[junit4:junit4]   2> 141 T202 oaz.Environment.logEnv Client environment:os.version=3.2.0-31-generic
[junit4:junit4]   2> 142 T202 oaz.Environment.logEnv Client environment:user.name=jenkins
[junit4:junit4]   2> 142 T202 oaz.Environment.logEnv Client environment:user.home=/var/lib/jenkins
[junit4:junit4]   2> 142 T202 oaz.Environment.logEnv Client environment:user.dir=/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build/solr-core/test/J1
[junit4:junit4]   2> 144 T202 oaz.ZooKeeper.<init> Initiating client connection, connectString=127.0.0.1:48755 sessionTimeout=10000 watcher=org.apache.solr.common.cloud.ConnectionManager@74d41df8
[junit4:junit4]   2> 162 T208 oaz.ClientCnxn$SendThread.startConnect Opening socket connection to server /127.0.0.1:48755
[junit4:junit4]   2> 162 T202 oascc.ConnectionManager.waitForConnected Waiting for client to connect to ZooKeeper
[junit4:junit4]   2> 165 T208 oaz.ClientCnxn$SendThread.primeConnection Socket connection established to localhost.localdomain/127.0.0.1:48755, initiating session
[junit4:junit4]   2> 165 T204 oazs.NIOServerCnxn$Factory.run Accepted socket connection from /127.0.0.1:59851
[junit4:junit4]   2> 172 T204 oazs.NIOServerCnxn.readConnectRequest Client attempting to establish new session at /127.0.0.1:59851
[junit4:junit4]   2> 178 T206 oazsp.FileTxnLog.append Creating new log file: log.1
[junit4:junit4]   2> 287 T206 oazs.NIOServerCnxn.finishSessionInit Established session 0x13a4492c1f40000 with negotiated timeout 10000 for client /127.0.0.1:59851
[junit4:junit4]   2> 287 T208 oaz.ClientCnxn$SendThread.readConnectResult Session establishment complete on server localhost.localdomain/127.0.0.1:48755, sessionid = 0x13a4492c1f40000, negotiated timeout = 10000
[junit4:junit4]   2> 289 T209 oascc.ConnectionManager.process Watcher org.apache.solr.common.cloud.ConnectionManager@74d41df8 name:ZooKeeperConnection Watcher:127.0.0.1:48755 got event WatchedEvent state:SyncConnected type:None path:null path:null type:None
[junit4:junit4]   2> 290 T202 oascc.ConnectionManager.waitForConnected Client is connected to ZooKeeper
[junit4:junit4]   2> 291 T202 oascc.SolrZkClient.makePath makePath: /solr
[junit4:junit4]   2> 318 T207 oazs.PrepRequestProcessor.pRequest Processed session termination for sessionid: 0x13a4492c1f40000
[junit4:junit4]   2> 319 T209 oaz.ClientCnxn$EventThread.run EventThread shut down
[junit4:junit4]   2> 319 T202 oaz.ZooKeeper.close Session: 0x13a4492c1f40000 closed
[junit4:junit4]   2> 319 T202 oaz.ZooKeeper.<init> Initiating client connection, connectString=127.0.0.1:48755/solr sessionTimeout=10000 watcher=org.apache.solr.common.cloud.ConnectionManager@6d54430d
[junit4:junit4]   2> 320 T204 oazs.NIOServerCnxn.closeSock Closed socket connection for client /127.0.0.1:59851 which had sessionid 0x13a4492c1f40000
[junit4:junit4]   2> 320 T210 oaz.ClientCnxn$SendThread.startConnect Opening socket connection to server /127.0.0.1:48755
[junit4:junit4]   2> 320 T202 oascc.ConnectionManager.waitForConnected Waiting for client to connect to ZooKeeper
[junit4:junit4]   2> 321 T210 oaz.ClientCnxn$SendThread.primeConnection Socket connection established to localhost.localdomain/127.0.0.1:48755, initiating session
[junit4:junit4]   2> 321 T204 oazs.NIOServerCnxn$Factory.run Accepted socket connection from /127.0.0.1:59852
[junit4:junit4]   2> 321 T204 oazs.NIOServerCnxn.readConnectRequest Client attempting to establish new session at /127.0.0.1:59852
[junit4:junit4]   2> 322 T206 oazs.NIOServerCnxn.finishSessionInit Established session 0x13a4492c1f40001 with negotiated timeout 10000 for client /127.0.0.1:59852
[junit4:junit4]   2> 322 T210 oaz.ClientCnxn$SendThread.readConnectResult Session establishment complete on server localhost.localdomain/127.0.0.1:48755, sessionid = 0x13a4492c1f40001, negotiated timeout = 10000
[junit4:junit4]   2> 323 T211 oascc.ConnectionManager.process Watcher org.apache.solr.common.cloud.ConnectionManager@6d54430d name:ZooKeeperConnection Watcher:127.0.0.1:48755/solr got event WatchedEvent state:SyncConnected type:None path:null path:null type:None
[junit4:junit4]   2> 323 T202 oascc.ConnectionManager.waitForConnected Client is connected to ZooKeeper
[junit4:junit4]   2> 325 T202 oascc.SolrZkClient.makePath makePath: /collections/collection1
[junit4:junit4]   2> 329 T202 oascc.SolrZkClient.makePath makePath: /collections/collection1/shards
[junit4:junit4]   2> 331 T202 oascc.SolrZkClient.makePath makePath: /collections/control_collection
[junit4:junit4]   2> 334 T202 oascc.SolrZkClient.makePath makePath: /collections/control_collection/shards
[junit4:junit4]   2> 337 T202 oasc.AbstractZkTestCase.putConfig put /mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build/solr-core/test-files/solr/collection1/conf/solrconfig.xml to /configs/conf1/solrconfig.xml
[junit4:junit4]   2> 345 T202 oascc.SolrZkClient.makePath makePath: /configs/conf1/solrconfig.xml
[junit4:junit4]   2> 351 T202 oasc.AbstractZkTestCase.putConfig put /mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build/solr-core/test-files/solr/collection1/conf/schema.xml to /configs/conf1/schema.xml
[junit4:junit4]   2> 352 T202 oascc.SolrZkClient.makePath makePath: /configs/conf1/schema.xml
[junit4:junit4]   2> 356 T202 oasc.AbstractZkTestCase.putConfig put /mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build/solr-core/test-files/solr/collection1/conf/solrconfig.xml to /configs/conf1/solrconfig.xml
[junit4:junit4]   2> 357 T202 oascc.SolrZkClient.makePath makePath: /configs/conf1/solrconfig.xml
[junit4:junit4]   2> 364 T202 oasc.AbstractZkTestCase.putConfig put /mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build/solr-core/test-files/solr/collection1/conf/stopwords.txt to /configs/conf1/stopwords.txt
[junit4:junit4]   2> 364 T202 oascc.SolrZkClient.makePath makePath: /configs/conf1/stopwords.txt
[junit4:junit4]   2> 367 T202 oasc.AbstractZkTestCase.putConfig put /mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build/solr-core/test-files/solr/collection1/conf/protwords.txt to /configs/conf1/protwords.txt
[junit4:junit4]   2> 367 T202 oascc.SolrZkClient.makePath makePath: /configs/conf1/protwords.txt
[junit4:junit4]   2> 370 T202 oasc.AbstractZkTestCase.putConfig put /mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build/solr-core/test-files/solr/collection1/conf/currency.xml to /configs/conf1/currency.xml
[junit4:junit4]   2> 370 T202 oascc.SolrZkClient.makePath makePath: /configs/conf1/currency.xml
[junit4:junit4]   2> 375 T202 oasc.AbstractZkTestCase.putConfig put /mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build/solr-core/test-files/solr/collection1/conf/open-exchange-rates.json to /configs/conf1/open-exchange-rates.json
[junit4:junit4]   2> 376 T202 oascc.SolrZkClient.makePath makePath: /configs/conf1/open-exchange-rates.json
[junit4:junit4]   2> 379 T202 oasc.AbstractZkTestCase.putConfig put /mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build/solr-core/test-files/solr/collection1/conf/mapping-ISOLatin1Accent.txt to /configs/conf1/mapping-ISOLatin1Accent.txt
[junit4:junit4]   2> 380 T202 oascc.SolrZkClient.makePath makePath: /configs/conf1/mapping-ISOLatin1Accent.txt
[junit4:junit4]   2> 383 T202 oasc.AbstractZkTestCase.putConfig put /mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build/solr-core/test-files/solr/collection1/conf/old_synonyms.txt to /configs/conf1/old_synonyms.txt
[junit4:junit4]   2> 384 T202 oascc.SolrZkClient.makePath makePath: /configs/conf1/old_synonyms.txt
[junit4:junit4]   2> 387 T202 oasc.AbstractZkTestCase.putConfig put /mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build/solr-core/test-files/solr/collection1/conf/synonyms.txt to /configs/conf1/synonyms.txt
[junit4:junit4]   2> 387 T202 oascc.SolrZkClient.makePath makePath: /configs/conf1/synonyms.txt
[junit4:junit4]   2> 390 T207 oazs.PrepRequestProcessor.pRequest Processed session termination for sessionid: 0x13a4492c1f40001
[junit4:junit4]   2> 391 T211 oaz.ClientCnxn$EventThread.run EventThread shut down
[junit4:junit4]   2> 391 T204 oazs.NIOServerCnxn.closeSock Closed socket connection for client /127.0.0.1:59852 which had sessionid 0x13a4492c1f40001
[junit4:junit4]   2> 391 T202 oaz.ZooKeeper.close Session: 0x13a4492c1f40001 closed
[junit4:junit4]   2> 438 T202 oejs.Server.doStart jetty-8.1.2.v20120308
[junit4:junit4]   2> 441 T202 oejs.AbstractConnector.doStart Started SocketConnector@0.0.0.0:39071
[junit4:junit4]   2> 442 T202 oasc.SolrResourceLoader.locateSolrHome JNDI not configured for solr (NoInitialContextEx)
[junit4:junit4]   2> 442 T202 oasc.SolrResourceLoader.locateSolrHome using system property solr.solr.home: /mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build/solr-core/test/J1/./org.apache.solr.cloud.RecoveryZkTest-controljetty-1349770199821
[junit4:junit4]   2> 442 T202 oasc.SolrResourceLoader.<init> new SolrResourceLoader for deduced Solr Home: '/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build/solr-core/test/J1/./org.apache.solr.cloud.RecoveryZkTest-controljetty-1349770199821/'
[junit4:junit4]   2> 454 T202 oass.SolrDispatchFilter.init SolrDispatchFilter.init()
[junit4:junit4]   2> 455 T202 oasc.SolrResourceLoader.locateSolrHome JNDI not configured for solr (NoInitialContextEx)
[junit4:junit4]   2> 455 T202 oasc.SolrResourceLoader.locateSolrHome using system property solr.solr.home: /mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build/solr-core/test/J1/./org.apache.solr.cloud.RecoveryZkTest-controljetty-1349770199821
[junit4:junit4]   2> 455 T202 oasc.CoreContainer$Initializer.initialize looking for solr.xml: /mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build/solr-core/test/J1/./org.apache.solr.cloud.RecoveryZkTest-controljetty-1349770199821/solr.xml
[junit4:junit4]   2> 455 T202 oasc.CoreContainer.<init> New CoreContainer 574927646
[junit4:junit4]   2> 456 T202 oasc.CoreContainer.load Loading CoreContainer using Solr Home: '/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build/solr-core/test/J1/./org.apache.solr.cloud.RecoveryZkTest-controljetty-1349770199821/'
[junit4:junit4]   2> 456 T202 oasc.SolrResourceLoader.<init> new SolrResourceLoader for directory: '/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build/solr-core/test/J1/./org.apache.solr.cloud.RecoveryZkTest-controljetty-1349770199821/'
[junit4:junit4]   2> 469 T202 oasc.CoreContainer.load Registering Log Listener
[junit4:junit4]   2> 476 T202 oasc.CoreContainer.initZooKeeper Zookeeper client=127.0.0.1:48755/solr
[junit4:junit4]   2> 483 T202 oaz.ZooKeeper.<init> Initiating client connection, connectString=127.0.0.1:48755/solr sessionTimeout=5000 watcher=org.apache.solr.common.cloud.ConnectionManager@1a6ff3f4
[junit4:junit4]   2> 484 T221 oaz.ClientCnxn$SendThread.startConnect Opening socket connection to server /127.0.0.1:48755
[junit4:junit4]   2> 484 T202 oascc.ConnectionManager.waitForConnected Waiting for client to connect to ZooKeeper
[junit4:junit4]   2> 485 T221 oaz.ClientCnxn$SendThread.primeConnection Socket connection established to localhost.localdomain/127.0.0.1:48755, initiating session
[junit4:junit4]   2> 485 T204 oazs.NIOServerCnxn$Factory.run Accepted socket connection from /127.0.0.1:59853
[junit4:junit4]   2> 486 T204 oazs.NIOServerCnxn.readConnectRequest Client attempting to establish new session at /127.0.0.1:59853
[junit4:junit4]   2> 487 T206 oazs.NIOServerCnxn.finishSessionInit Established session 0x13a4492c1f40002 with negotiated timeout 5000 for client /127.0.0.1:59853
[junit4:junit4]   2> 487 T221 oaz.ClientCnxn$SendThread.readConnectResult Session establishment complete on server localhost.localdomain/127.0.0.1:48755, sessionid = 0x13a4492c1f40002, negotiated timeout = 5000
[junit4:junit4]   2> 487 T222 oascc.ConnectionManager.process Watcher org.apache.solr.common.cloud.ConnectionManager@1a6ff3f4 name:ZooKeeperConnection Watcher:127.0.0.1:48755/solr got event WatchedEvent state:SyncConnected type:None path:null path:null type:None
[junit4:junit4]   2> 487 T202 oascc.ConnectionManager.waitForConnected Client is connected to ZooKeeper
[junit4:junit4]   2> 494 T207 oazs.PrepRequestProcessor.pRequest Got user-level KeeperException when processing sessionid:0x13a4492c1f40002 type:create cxid:0x2 zxid:0xfffffffffffffffe txntype:unknown reqpath:n/a Error Path:/solr/overseer Error:KeeperErrorCode = NodeExists for /solr/overseer
[junit4:junit4]   2> 497 T202 oascc.SolrZkClient.makePath makePath: /live_nodes
[junit4:junit4]   2> 499 T202 oasc.ZkController.createEphemeralLiveNode Register node as live in ZooKeeper:/live_nodes/127.0.0.1:39071_solr
[junit4:junit4]   2> 501 T207 oazs.PrepRequestProcessor.pRequest Got user-level KeeperException when processing sessionid:0x13a4492c1f40002 type:delete cxid:0x7 zxid:0xfffffffffffffffe txntype:unknown reqpath:n/a Error Path:/solr/live_nodes/127.0.0.1:39071_solr Error:KeeperErrorCode = NoNode for /solr/live_nodes/127.0.0.1:39071_solr
[junit4:junit4]   2> 502 T202 oascc.SolrZkClient.makePath makePath: /live_nodes/127.0.0.1:39071_solr
[junit4:junit4]   2> 504 T202 oashc.HttpShardHandlerFactory.getParameter Setting socketTimeout to: 0
[junit4:junit4]   2> 505 T202 oashc.HttpShardHandlerFactory.getParameter Setting urlScheme to: http://
[junit4:junit4]   2> 505 T202 oashc.HttpShardHandlerFactory.getParameter Setting connTimeout to: 0
[junit4:junit4]   2> 505 T202 oashc.HttpShardHandlerFactory.getParameter Setting maxConnectionsPerHost to: 20
[junit4:junit4]   2> 505 T202 oashc.HttpShardHandlerFactory.getParameter Setting corePoolSize to: 0
[junit4:junit4]   2> 506 T202 oashc.HttpShardHandlerFactory.getParameter Setting maximumPoolSize to: 2147483647
[junit4:junit4]   2> 506 T202 oashc.HttpShardHandlerFactory.getParameter Setting maxThreadIdleTime to: 5
[junit4:junit4]   2> 506 T202 oashc.HttpShardHandlerFactory.getParameter Setting sizeOfQueue to: -1
[junit4:junit4]   2> 507 T202 oashc.HttpShardHandlerFactory.getParameter Setting fairnessPolicy to: false
[junit4:junit4]   2> 507 T202 oascsi.HttpClientUtil.createClient Creating new http client, config:maxConnectionsPerHost=20&maxConnections=10000&socketTimeout=0&connTimeout=0&retry=false
[junit4:junit4]   2> 511 T202 oascc.SolrZkClient.makePath makePath: /overseer_elect/election
[junit4:junit4]   2> 521 T207 oazs.PrepRequestProcessor.pRequest Got user-level KeeperException when processing sessionid:0x13a4492c1f40002 type:delete cxid:0x15 zxid:0xfffffffffffffffe txntype:unknown reqpath:n/a Error Path:/solr/overseer_elect/leader Error:KeeperErrorCode = NoNode for /solr/overseer_elect/leader
[junit4:junit4]   2> 521 T202 oascc.SolrZkClient.makePath makePath: /overseer_elect/leader
[junit4:junit4]   2> 524 T202 oasc.Overseer.start Overseer (id=88458539797053442-127.0.0.1:39071_solr-n_0000000000) starting
[junit4:junit4]   2> 525 T207 oazs.PrepRequestProcessor.pRequest Got user-level KeeperException when processing sessionid:0x13a4492c1f40002 type:create cxid:0x1a zxid:0xfffffffffffffffe txntype:unknown reqpath:n/a Error Path:/solr/overseer Error:KeeperErrorCode = NodeExists for /solr/overseer
[junit4:junit4]   2> 528 T207 oazs.PrepRequestProcessor.pRequest Got user-level KeeperException when processing sessionid:0x13a4492c1f40002 type:create cxid:0x1b zxid:0xfffffffffffffffe txntype:unknown reqpath:n/a Error Path:/solr/overseer Error:KeeperErrorCode = NodeExists for /solr/overseer
[junit4:junit4]   2> 529 T207 oazs.PrepRequestProcessor.pRequest Got user-level KeeperException when processing sessionid:0x13a4492c1f40002 type:create cxid:0x1c zxid:0xfffffffffffffffe txntype:unknown reqpath:n/a Error Path:/solr/overseer Error:KeeperErrorCode = NodeExists for /solr/overseer
[junit4:junit4]   2> 532 T207 oazs.PrepRequestProcessor.pRequest Got user-level KeeperException when processing sessionid:0x13a4492c1f40002 type:create cxid:0x1d zxid:0xfffffffffffffffe txntype:unknown reqpath:n/a Error Path:/solr/overseer Error:KeeperErrorCode = NodeExists for /solr/overseer
[junit4:junit4]   2> 533 T224 oasc.OverseerCollectionProcessor.run Process current queue of collection creations
[junit4:junit4]   2> 533 T202 oascc.SolrZkClient.makePath makePath: /clusterstate.json
[junit4:junit4]   2> 535 T202 oascc.ZkStateReader.createClusterStateWatchersAndUpdate Updating cluster state from ZooKeeper... 
[junit4:junit4]   2> 543 T223 oasc.Overseer$ClusterStateUpdater.run Starting to work on the main queue
[junit4:junit4]   2> 546 T202 oasc.CoreContainer.create Creating SolrCore 'collection1' using instanceDir: /mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build/solr-core/test/J1/./org.apache.solr.cloud.RecoveryZkTest-controljetty-1349770199821/collection1
[junit4:junit4]   2> 547 T202 oasc.ZkController.createCollectionZkNode Check for collection zkNode:control_collection
[junit4:junit4]   2> 548 T202 oasc.ZkController.createCollectionZkNode Collection zkNode exists
[junit4:junit4]   2> 548 T202 oasc.ZkController.readConfigName Load collection config from:/collections/control_collection
[junit4:junit4]   2> 549 T202 oasc.SolrResourceLoader.<init> new SolrResourceLoader for directory: '/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build/solr-core/test/J1/./org.apache.solr.cloud.RecoveryZkTest-controljetty-1349770199821/collection1/'
[junit4:junit4]   2> 550 T202 oasc.SolrResourceLoader.replaceClassLoader Adding 'file:/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build/solr-core/test/J1/org.apache.solr.cloud.RecoveryZkTest-controljetty-1349770199821/collection1/lib/README' to classloader
[junit4:junit4]   2> 550 T202 oasc.SolrResourceLoader.replaceClassLoader Adding 'file:/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build/solr-core/test/J1/org.apache.solr.cloud.RecoveryZkTest-controljetty-1349770199821/collection1/lib/classes/' to classloader
[junit4:junit4]   2> 580 T202 oasc.SolrConfig.<init> Using Lucene MatchVersion: LUCENE_50
[junit4:junit4]   2> 615 T202 oasc.SolrConfig.<init> Loaded SolrConfig: solrconfig.xml
[junit4:junit4]   2> 617 T202 oass.IndexSchema.readSchema Reading Solr Schema
[junit4:junit4]   2> 625 T202 oass.IndexSchema.readSchema Schema name=test
[junit4:junit4]   2> 949 T202 oass.OpenExchangeRatesOrgProvider.init Initialized with rates=open-exchange-rates.json, refreshInterval=1440.
[junit4:junit4]   2> 959 T202 oass.IndexSchema.readSchema default search field in schema is text
[junit4:junit4]   2> 962 T202 oass.IndexSchema.readSchema unique key field: id
[junit4:junit4]   2> 978 T202 oass.FileExchangeRateProvider.reload Reloading exchange rates from file currency.xml
[junit4:junit4]   2> 981 T202 oass.FileExchangeRateProvider.reload Reloading exchange rates from file currency.xml
[junit4:junit4]   2> 985 T202 oass.OpenExchangeRatesOrgProvider.reload Reloading exchange rates from open-exchange-rates.json
[junit4:junit4]   2> 987 T202 oass.OpenExchangeRatesOrgProvider.reload Reloading exchange rates from open-exchange-rates.json
[junit4:junit4]   2> 988 T202 oasc.SolrCore.<init> [collection1] Opening new SolrCore at /mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build/solr-core/test/J1/./org.apache.solr.cloud.RecoveryZkTest-controljetty-1349770199821/collection1/, dataDir=./org.apache.solr.cloud.RecoveryZkTest-1349770199433/control/data/
[junit4:junit4]   2> 989 T202 oasc.JmxMonitoredMap.<init> JMX monitoring is enabled. Adding Solr mbeans to JMX Server: com.sun.jmx.mbeanserver.JmxMBeanServer@7048dc0f
[junit4:junit4]   2> 996 T202 oasc.SolrCore.getNewIndexDir New index directory detected: old=null new=./org.apache.solr.cloud.RecoveryZkTest-1349770199433/control/data/index/
[junit4:junit4]   2> 996 T202 oasc.SolrCore.initIndex WARNING [collection1] Solr index directory './org.apache.solr.cloud.RecoveryZkTest-1349770199433/control/data/index' doesn't exist. Creating new index...
[junit4:junit4]   2> 997 T202 oasc.CachingDirectoryFactory.get return new directory for /mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build/solr-core/test/J1/./org.apache.solr.cloud.RecoveryZkTest-1349770199433/control/data/index forceNew:false
[junit4:junit4]   2> 1000 T202 oasc.SolrDeletionPolicy.onCommit SolrDeletionPolicy.onCommit: commits:num=1
[junit4:junit4]   2> 		commit{dir=/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build/solr-core/test/J1/org.apache.solr.cloud.RecoveryZkTest-1349770199433/control/data/index,segFN=segments_1,generation=1,filenames=[segments_1]
[junit4:junit4]   2> 1000 T202 oasc.SolrDeletionPolicy.updateCommits newest commit = 1
[junit4:junit4]   2> 1001 T202 oasc.SolrCore.initWriters created xml: solr.XMLResponseWriter
[junit4:junit4]   2> 1003 T202 oasup.UpdateRequestProcessorChain.init inserting DistributedUpdateProcessorFactory into updateRequestProcessorChain "dedupe"
[junit4:junit4]   2> 1003 T202 oasup.UpdateRequestProcessorChain.init inserting DistributedUpdateProcessorFactory into updateRequestProcessorChain "dedupe-allfields"
[junit4:junit4]   2> 1004 T202 oasup.UpdateRequestProcessorChain.init inserting DistributedUpdateProcessorFactory into updateRequestProcessorChain "stored_sig"
[junit4:junit4]   2> 1004 T202 oasup.UpdateRequestProcessorChain.init inserting DistributedUpdateProcessorFactory into updateRequestProcessorChain "uniq-fields"
[junit4:junit4]   2> 1005 T202 oasup.UpdateRequestProcessorChain.init inserting DistributedUpdateProcessorFactory into updateRequestProcessorChain "distrib-dup-test-chain-implicit"
[junit4:junit4]   2> 1005 T202 oasc.RequestHandlers.initHandlersFromConfig adding lazy requestHandler: solr.ReplicationHandler
[junit4:junit4]   2> 1005 T202 oasc.RequestHandlers.initHandlersFromConfig created /replication: solr.ReplicationHandler
[junit4:junit4]   2> 1006 T202 oasc.RequestHandlers.initHandlersFromConfig created standard: solr.StandardRequestHandler
[junit4:junit4]   2> 1007 T202 oasc.RequestHandlers.initHandlersFromConfig created /get: solr.RealTimeGetHandler
[junit4:junit4]   2> 1007 T202 oasc.RequestHandlers.initHandlersFromConfig created dismax: solr.SearchHandler
[junit4:junit4]   2> 1008 T202 oasc.RequestHandlers.initHandlersFromConfig created mock: org.apache.solr.core.MockQuerySenderListenerReqHandler
[junit4:junit4]   2> 1009 T202 oasc.RequestHandlers.initHandlersFromConfig created /admin/: org.apache.solr.handler.admin.AdminHandlers
[junit4:junit4]   2> 1009 T202 oasc.RequestHandlers.initHandlersFromConfig created defaults: solr.StandardRequestHandler
[junit4:junit4]   2> 1010 T202 oasc.RequestHandlers.initHandlersFromConfig adding lazy requestHandler: solr.StandardRequestHandler
[junit4:junit4]   2> 1010 T202 oasc.RequestHandlers.initHandlersFromConfig created lazy: solr.StandardRequestHandler
[junit4:junit4]   2> 1011 T202 oasc.RequestHandlers.initHandlersFromConfig created /update: solr.UpdateRequestHandler
[junit4:junit4]   2> 1011 T202 oasc.RequestHandlers.initHandlersFromConfig created /terms: org.apache.solr.handler.component.SearchHandler
[junit4:junit4]   2> 1011 T202 oasc.RequestHandlers.initHandlersFromConfig created spellCheckCompRH: org.apache.solr.handler.component.SearchHandler
[junit4:junit4]   2> 1012 T202 oasc.RequestHandlers.initHandlersFromConfig created spellCheckCompRH_Direct: org.apache.solr.handler.component.SearchHandler
[junit4:junit4]   2> 1012 T202 oasc.RequestHandlers.initHandlersFromConfig created spellCheckWithWordbreak: org.apache.solr.handler.component.SearchHandler
[junit4:junit4]   2> 1013 T202 oasc.RequestHandlers.initHandlersFromConfig created spellCheckWithWordbreak_Direct: org.apache.solr.handler.component.SearchHandler
[junit4:junit4]   2> 1013 T202 oasc.RequestHandlers.initHandlersFromConfig created spellCheckCompRH1: org.apache.solr.handler.component.SearchHandler
[junit4:junit4]   2> 1014 T202 oasc.RequestHandlers.initHandlersFromConfig created tvrh: org.apache.solr.handler.component.SearchHandler
[junit4:junit4]   2> 1014 T202 oasc.RequestHandlers.initHandlersFromConfig created /mlt: solr.MoreLikeThisHandler
[junit4:junit4]   2> 1015 T202 oasc.RequestHandlers.initHandlersFromConfig created /debug/dump: solr.DumpRequestHandler
[junit4:junit4]   2> 1017 T202 oashl.XMLLoader.init xsltCacheLifetimeSeconds=60
[junit4:junit4]   2> 1019 T202 oasc.SolrCore.initDeprecatedSupport WARNING solrconfig.xml uses deprecated <admin/gettableFiles>, Please update your config to use the ShowFileRequestHandler.
[junit4:junit4]   2> 1020 T202 oasc.SolrCore.initDeprecatedSupport WARNING adding ShowFileRequestHandler with hidden files: [SCHEMA.XML, OLD_SYNONYMS.TXT, STOPWORDS.TXT, PROTWORDS.TXT, OPEN-EXCHANGE-RATES.JSON, SYNONYMS.TXT, CURRENCY.XML, MAPPING-ISOLATIN1ACCENT.TXT]
[junit4:junit4]   2> 1022 T202 oass.SolrIndexSearcher.<init> Opening Searcher@7d87608e main
[junit4:junit4]   2> 1023 T202 oasu.CommitTracker.<init> Hard AutoCommit: disabled
[junit4:junit4]   2> 1024 T202 oasu.CommitTracker.<init> Soft AutoCommit: disabled
[junit4:junit4]   2> 1024 T202 oashc.SpellCheckComponent.inform Initializing spell checkers
[junit4:junit4]   2> 1033 T202 oass.DirectSolrSpellChecker.init init: {name=direct,classname=DirectSolrSpellChecker,field=lowerfilt,minQueryLength=3}
[junit4:junit4]   2> 1058 T225 oasc.SolrCore.registerSearcher [collection1] Registered new searcher Searcher@7d87608e main{StandardDirectoryReader(segments_1:1)}
[junit4:junit4]   2> 1065 T207 oazs.PrepRequestProcessor.pRequest Got user-level KeeperException when processing sessionid:0x13a4492c1f40002 type:create cxid:0x53 zxid:0xfffffffffffffffe txntype:unknown reqpath:n/a Error Path:/solr/overseer/queue Error:KeeperErrorCode = NoNode for /solr/overseer/queue
[junit4:junit4]   2> 1068 T202 oasc.CoreContainer.register registering core: collection1
[junit4:junit4]   2> 1069 T202 oasc.ZkController.register Register shard - core:collection1 address:http://127.0.0.1:39071/solr shardId:control_shard
[junit4:junit4]   2> 1072 T202 oascsi.HttpClientUtil.createClient Creating new http client, config:maxConnections=10000&maxConnectionsPerHost=20&connTimeout=30000&socketTimeout=30000&retry=false
[junit4:junit4]   2> 1080 T202 oascc.SolrZkClient.makePath makePath: /collections/control_collection/leader_elect/control_shard/election
[junit4:junit4]   2> 1091 T207 oazs.PrepRequestProcessor.pRequest Got user-level KeeperException when processing sessionid:0x13a4492c1f40002 type:delete cxid:0x62 zxid:0xfffffffffffffffe txntype:unknown reqpath:n/a Error Path:/solr/collections/control_collection/leaders Error:KeeperErrorCode = NoNode for /solr/collections/control_collection/leaders
[junit4:junit4]   2> 1091 T202 oasc.ShardLeaderElectionContext.runLeaderProcess Running the leader process.
[junit4:junit4]   2> 1092 T207 oazs.PrepRequestProcessor.pRequest Got user-level KeeperException when processing sessionid:0x13a4492c1f40002 type:create cxid:0x63 zxid:0xfffffffffffffffe txntype:unknown reqpath:n/a Error Path:/solr/overseer Error:KeeperErrorCode = NodeExists for /solr/overseer
[junit4:junit4]   2> 1550 T223 oascc.ZkStateReader.updateClusterState Updating cloud state from ZooKeeper... 
[junit4:junit4]   2> 1555 T207 oazs.PrepRequestProcessor.pRequest Got user-level KeeperException when processing sessionid:0x13a4492c1f40002 type:create cxid:0x6a zxid:0xfffffffffffffffe txntype:unknown reqpath:n/a Error Path:/solr/overseer/queue-work Error:KeeperErrorCode = NoNode for /solr/overseer/queue-work
[junit4:junit4]   2> 1569 T222 oascc.ZkStateReader$2.process A cluster state change has occurred - updating...
[junit4:junit4]   2> 1595 T202 oasc.ShardLeaderElectionContext.waitForReplicasToComeUp Enough replicas found to continue.
[junit4:junit4]   2> 1595 T202 oasc.ShardLeaderElectionContext.runLeaderProcess I may be the new leader - try and sync
[junit4:junit4]   2> 1596 T202 oasc.SyncStrategy.sync Sync replicas to http://127.0.0.1:39071/solr/collection1/
[junit4:junit4]   2> 1596 T202 oasc.SyncStrategy.syncReplicas Sync Success - now sync replicas to me
[junit4:junit4]   2> 1596 T202 oasc.SyncStrategy.syncToMe http://127.0.0.1:39071/solr/collection1/ has no replicas
[junit4:junit4]   2> 1597 T202 oasc.ShardLeaderElectionContext.runLeaderProcess I am the new leader: http://127.0.0.1:39071/solr/collection1/
[junit4:junit4]   2> 1597 T202 oascc.SolrZkClient.makePath makePath: /collections/control_collection/leaders/control_shard
[junit4:junit4]   2> 1602 T207 oazs.PrepRequestProcessor.pRequest Got user-level KeeperException when processing sessionid:0x13a4492c1f40002 type:create cxid:0x88 zxid:0xfffffffffffffffe txntype:unknown reqpath:n/a Error Path:/solr/overseer Error:KeeperErrorCode = NodeExists for /solr/overseer
[junit4:junit4]   2> 2076 T223 oascc.ZkStateReader.updateClusterState Updating cloud state from ZooKeeper... 
[junit4:junit4]   2> 2080 T222 oascc.ZkStateReader$2.process A cluster state change has occurred - updating...
[junit4:junit4]   2> 2105 T202 oasc.ZkController.register We are http://127.0.0.1:39071/solr/collection1/ and leader is http://127.0.0.1:39071/solr/collection1/
[junit4:junit4]   2> 2106 T202 oasc.ZkController.register No LogReplay needed for core=collection1 baseURL=http://127.0.0.1:39071/solr
[junit4:junit4]   2> 2106 T202 oasc.ZkController.checkRecovery I am the leader, no recovery necessary
[junit4:junit4]   2> 2108 T202 oascc.ZkStateReader.updateClusterState Updating cloud state from ZooKeeper... 
[junit4:junit4]   2> 2109 T202 oass.SolrDispatchFilter.init user.dir=/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build/solr-core/test/J1
[junit4:junit4]   2> 2109 T202 oass.SolrDispatchFilter.init SolrDispatchFilter.init() done
[junit4:junit4]   2> 2110 T202 oascsi.HttpClientUtil.createClient Creating new http client, config:maxConnections=128&maxConnectionsPerHost=32&followRedirects=false
[junit4:junit4]   2> 2158 T202 oejs.Server.doStart jetty-8.1.2.v20120308
[junit4:junit4]   2> 2159 T202 oejs.AbstractConnector.doStart Started SocketConnector@0.0.0.0:52151
[junit4:junit4]   2> 2160 T202 oasc.SolrResourceLoader.locateSolrHome JNDI not configured for solr (NoInitialContextEx)
[junit4:junit4]   2> 2160 T202 oasc.SolrResourceLoader.locateSolrHome using system property solr.solr.home: /mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build/solr-core/test/J1/./org.apache.solr.cloud.RecoveryZkTest-jetty1-1349770201542
[junit4:junit4]   2> 2161 T202 oasc.SolrResourceLoader.<init> new SolrResourceLoader for deduced Solr Home: '/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build/solr-core/test/J1/./org.apache.solr.cloud.RecoveryZkTest-jetty1-1349770201542/'
[junit4:junit4]   2> 2173 T202 oass.SolrDispatchFilter.init SolrDispatchFilter.init()
[junit4:junit4]   2> 2174 T202 oasc.SolrResourceLoader.locateSolrHome JNDI not configured for solr (NoInitialContextEx)
[junit4:junit4]   2> 2174 T202 oasc.SolrResourceLoader.locateSolrHome using system property solr.solr.home: /mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build/solr-core/test/J1/./org.apache.solr.cloud.RecoveryZkTest-jetty1-1349770201542
[junit4:junit4]   2> 2174 T202 oasc.CoreContainer$Initializer.initialize looking for solr.xml: /mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build/solr-core/test/J1/./org.apache.solr.cloud.RecoveryZkTest-jetty1-1349770201542/solr.xml
[junit4:junit4]   2> 2175 T202 oasc.CoreContainer.<init> New CoreContainer 578771657
[junit4:junit4]   2> 2175 T202 oasc.CoreContainer.load Loading CoreContainer using Solr Home: '/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build/solr-core/test/J1/./org.apache.solr.cloud.RecoveryZkTest-jetty1-1349770201542/'
[junit4:junit4]   2> 2176 T202 oasc.SolrResourceLoader.<init> new SolrResourceLoader for directory: '/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build/solr-core/test/J1/./org.apache.solr.cloud.RecoveryZkTest-jetty1-1349770201542/'
[junit4:junit4]   2> 2192 T202 oasc.CoreContainer.load Registering Log Listener
[junit4:junit4]   2> 2200 T202 oasc.CoreContainer.initZooKeeper Zookeeper client=127.0.0.1:48755/solr
[junit4:junit4]   2> 2200 T202 oaz.ZooKeeper.<init> Initiating client connection, connectString=127.0.0.1:48755/solr sessionTimeout=5000 watcher=org.apache.solr.common.cloud.ConnectionManager@4e0e5521
[junit4:junit4]   2> 2201 T235 oaz.ClientCnxn$SendThread.startConnect Opening socket connection to server /127.0.0.1:48755
[junit4:junit4]   2> 2201 T202 oascc.ConnectionManager.waitForConnected Waiting for client to connect to ZooKeeper
[junit4:junit4]   2> 2202 T235 oaz.ClientCnxn$SendThread.primeConnection Socket connection established to localhost.localdomain/127.0.0.1:48755, initiating session
[junit4:junit4]   2> 2202 T204 oazs.NIOServerCnxn$Factory.run Accepted socket connection from /127.0.0.1:59854
[junit4:junit4]   2> 2202 T204 oazs.NIOServerCnxn.readConnectRequest Client attempting to establish new session at /127.0.0.1:59854
[junit4:junit4]   2> 2203 T206 oazs.NIOServerCnxn.finishSessionInit Established session 0x13a4492c1f40003 with negotiated timeout 5000 for client /127.0.0.1:59854
[junit4:junit4]   2> 2204 T235 oaz.ClientCnxn$SendThread.readConnectResult Session establishment complete on server localhost.localdomain/127.0.0.1:48755, sessionid = 0x13a4492c1f40003, negotiated timeout = 5000
[junit4:junit4]   2> 2204 T236 oascc.ConnectionManager.process Watcher org.apache.solr.common.cloud.ConnectionManager@4e0e5521 name:ZooKeeperConnection Watcher:127.0.0.1:48755/solr got event WatchedEvent state:SyncConnected type:None path:null path:null type:None
[junit4:junit4]   2> 2204 T202 oascc.ConnectionManager.waitForConnected Client is connected to ZooKeeper
[junit4:junit4]   2> 2205 T207 oazs.PrepRequestProcessor.pRequest Got user-level KeeperException when processing sessionid:0x13a4492c1f40003 type:create cxid:0x1 zxid:0xfffffffffffffffe txntype:unknown reqpath:n/a Error Path:/solr/overseer Error:KeeperErrorCode = NodeExists for /solr/overseer
[junit4:junit4]   2> 2206 T207 oazs.PrepRequestProcessor.pRequest Got user-level KeeperException when processing sessionid:0x13a4492c1f40003 type:create cxid:0x2 zxid:0xfffffffffffffffe txntype:unknown reqpath:n/a Error Path:/solr/overseer Error:KeeperErrorCode = NodeExists for /solr/overseer
[junit4:junit4]   2> 2210 T202 oasc.ZkController.createEphemeralLiveNode Register node as live in ZooKeeper:/live_nodes/127.0.0.1:52151_solr
[junit4:junit4]   2> 2211 T207 oazs.PrepRequestProcessor.pRequest Got user-level KeeperException when processing sessionid:0x13a4492c1f40003 type:delete cxid:0x4 zxid:0xfffffffffffffffe txntype:unknown reqpath:n/a Error Path:/solr/live_nodes/127.0.0.1:52151_solr Error:KeeperErrorCode = NoNode for /solr/live_nodes/127.0.0.1:52151_solr
[junit4:junit4]   2> 2212 T202 oascc.SolrZkClient.makePath makePath: /live_nodes/127.0.0.1:52151_solr
[junit4:junit4]   2> 2214 T222 oascc.ZkStateReader$3.process Updating live nodes
[junit4:junit4]   2> 2215 T202 oashc.HttpShardHandlerFactory.getParameter Setting socketTimeout to: 0
[junit4:junit4]   2> 2216 T202 oashc.HttpShardHandlerFactory.getParameter Setting urlScheme to: http://
[junit4:junit4]   2> 2216 T202 oashc.HttpShardHandlerFactory.getParameter Setting connTimeout to: 0
[junit4:junit4]   2> 2216 T202 oashc.HttpShardHandlerFactory.getParameter Setting maxConnectionsPerHost to: 20
[junit4:junit4]   2> 2217 T202 oashc.HttpShardHandlerFactory.getParameter Setting corePoolSize to: 0
[junit4:junit4]   2> 2217 T202 oashc.HttpShardHandlerFactory.getParameter Setting maximumPoolSize to: 2147483647
[junit4:junit4]   2> 2217 T202 oashc.HttpShardHandlerFactory.getParameter Setting maxThreadIdleTime to: 5
[junit4:junit4]   2> 2218 T202 oashc.HttpShardHandlerFactory.getParameter Setting sizeOfQueue to: -1
[junit4:junit4]   2> 2218 T202 oashc.HttpShardHandlerFactory.getParameter Setting fairnessPolicy to: false
[junit4:junit4]   2> 2218 T202 oascsi.HttpClientUtil.createClient Creating new http client, config:maxConnectionsPerHost=20&maxConnections=10000&socketTimeout=0&connTimeout=0&retry=false
[junit4:junit4]   2> 2227 T202 oascc.ZkStateReader.createClusterStateWatchersAndUpdate Updating cluster state from ZooKeeper... 
[junit4:junit4]   2> 2234 T202 oasc.CoreContainer.create Creating SolrCore 'collection1' using instanceDir: /mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build/solr-core/test/J1/./org.apache.solr.cloud.RecoveryZkTest-jetty1-1349770201542/collection1
[junit4:junit4]   2> 2235 T202 oasc.ZkController.createCollectionZkNode Check for collection zkNode:collection1
[junit4:junit4]   2> 2236 T202 oasc.ZkController.createCollectionZkNode Collection zkNode exists
[junit4:junit4]   2> 2237 T202 oasc.ZkController.readConfigName Load collection config from:/collections/collection1
[junit4:junit4]   2> 2238 T202 oasc.SolrResourceLoader.<init> new SolrResourceLoader for directory: '/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build/solr-core/test/J1/./org.apache.solr.cloud.RecoveryZkTest-jetty1-1349770201542/collection1/'
[junit4:junit4]   2> 2239 T202 oasc.SolrResourceLoader.replaceClassLoader Adding 'file:/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build/solr-core/test/J1/org.apache.solr.cloud.RecoveryZkTest-jetty1-1349770201542/collection1/lib/README' to classloader
[junit4:junit4]   2> 2240 T202 oasc.SolrResourceLoader.replaceClassLoader Adding 'file:/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build/solr-core/test/J1/org.apache.solr.cloud.RecoveryZkTest-jetty1-1349770201542/collection1/lib/classes/' to classloader
[junit4:junit4]   2> 2280 T202 oasc.SolrConfig.<init> Using Lucene MatchVersion: LUCENE_50
[junit4:junit4]   2> 2322 T202 oasc.SolrConfig.<init> Loaded SolrConfig: solrconfig.xml
[junit4:junit4]   2> 2323 T202 oass.IndexSchema.readSchema Reading Solr Schema
[junit4:junit4]   2> 2330 T202 oass.IndexSchema.readSchema Schema name=test
[junit4:junit4]   2> 2592 T223 oascc.ZkStateReader.updateClusterState Updating cloud state from ZooKeeper... 
[junit4:junit4]   2> 2597 T222 oascc.ZkStateReader$2.process A cluster state change has occurred - updating...
[junit4:junit4]   2> 2597 T236 oascc.ZkStateReader$2.process A cluster state change has occurred - updating...
[junit4:junit4]   2> 2679 T202 oass.OpenExchangeRatesOrgProvider.init Initialized with rates=open-exchange-rates.json, refreshInterval=1440.
[junit4:junit4]   2> 2689 T202 oass.IndexSchema.readSchema default search field in schema is text
[junit4:junit4]   2> 2693 T202 oass.IndexSchema.readSchema unique key field: id
[junit4:junit4]   2> 2716 T202 oass.FileExchangeRateProvider.reload Reloading exchange rates from file currency.xml
[junit4:junit4]   2> 2721 T202 oass.FileExchangeRateProvider.reload Reloading exchange rates from file currency.xml
[junit4:junit4]   2> 2726 T202 oass.OpenExchangeRatesOrgProvider.reload Reloading exchange rates from open-exchange-rates.json
[junit4:junit4]   2> 2728 T202 oass.OpenExchangeRatesOrgProvider.reload Reloading exchange rates from open-exchange-rates.json
[junit4:junit4]   2> 2730 T202 oasc.SolrCore.<init> [collection1] Opening new SolrCore at /mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build/solr-core/test/J1/./org.apache.solr.cloud.RecoveryZkTest-jetty1-1349770201542/collection1/, dataDir=./org.apache.solr.cloud.RecoveryZkTest-1349770199433/jetty1/
[junit4:junit4]   2> 2731 T202 oasc.JmxMonitoredMap.<init> JMX monitoring is enabled. Adding Solr mbeans to JMX Server: com.sun.jmx.mbeanserver.JmxMBeanServer@7048dc0f
[junit4:junit4]   2> 2732 T202 oasc.SolrCore.getNewIndexDir New index directory detected: old=null new=./org.apache.solr.cloud.RecoveryZkTest-1349770199433/jetty1/index/
[junit4:junit4]   2> 2733 T202 oasc.SolrCore.initIndex WARNING [collection1] Solr index directory './org.apache.solr.cloud.RecoveryZkTest-1349770199433/jetty1/index' doesn't exist. Creating new index...
[junit4:junit4]   2> 2733 T202 oasc.CachingDirectoryFactory.get return new directory for /mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build/solr-core/test/J1/./org.apache.solr.cloud.RecoveryZkTest-1349770199433/jetty1/index forceNew:false
[junit4:junit4]   2> 2738 T202 oasc.SolrDeletionPolicy.onCommit SolrDeletionPolicy.onCommit: commits:num=1
[junit4:junit4]   2> 		commit{dir=/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build/solr-core/test/J1/org.apache.solr.cloud.RecoveryZkTest-1349770199433/jetty1/index,segFN=segments_1,generation=1,filenames=[segments_1]
[junit4:junit4]   2> 2738 T202 oasc.SolrDeletionPolicy.updateCommits newest commit = 1
[junit4:junit4]   2> 2739 T202 oasc.SolrCore.initWriters created xml: solr.XMLResponseWriter
[junit4:junit4]   2> 2741 T202 oasup.UpdateRequestProcessorChain.init inserting DistributedUpdateProcessorFactory into updateRequestProcessorChain "dedupe"
[junit4:junit4]   2> 2741 T202 oasup.UpdateRequestProcessorChain.init inserting DistributedUpdateProcessorFactory into updateRequestProcessorChain "dedupe-allfields"
[junit4:junit4]   2> 2742 T202 oasup.UpdateRequestProcessorChain.init inserting DistributedUpdateProcessorFactory into updateRequestProcessorChain "stored_sig"
[junit4:junit4]   2> 2742 T202 oasup.UpdateRequestProcessorChain.init inserting DistributedUpdateProcessorFactory into updateRequestProcessorChain "uniq-fields"
[junit4:junit4]   2> 2743 T202 oasup.UpdateRequestProcessorChain.init inserting DistributedUpdateProcessorFactory into updateRequestProcessorChain "distrib-dup-test-chain-implicit"
[junit4:junit4]   2> 2743 T202 oasc.RequestHandlers.initHandlersFromConfig adding lazy requestHandler: solr.ReplicationHandler
[junit4:junit4]   2> 2744 T202 oasc.RequestHandlers.initHandlersFromConfig created /replication: solr.ReplicationHandler
[junit4:junit4]   2> 2744 T202 oasc.RequestHandlers.initHandlersFromConfig created standard: solr.StandardRequestHandler
[junit4:junit4]   2> 2745 T202 oasc.RequestHandlers.initHandlersFromConfig created /get: solr.RealTimeGetHandler
[junit4:junit4]   2> 2745 T202 oasc.RequestHandlers.initHandlersFromConfig created dismax: solr.SearchHandler
[junit4:junit4]   2> 2746 T202 oasc.RequestHandlers.initHandlersFromConfig created mock: org.apache.solr.core.MockQuerySenderListenerReqHandler
[junit4:junit4]   2> 2746 T202 oasc.RequestHandlers.initHandlersFromConfig created /admin/: org.apache.solr.handler.admin.AdminHandlers
[junit4:junit4]   2> 2747 T202 oasc.RequestHandlers.initHandlersFromConfig created defaults: solr.StandardRequestHandler
[junit4:junit4]   2> 2747 T202 oasc.RequestHandlers.initHandlersFromConfig adding lazy requestHandler: solr.StandardRequestHandler
[junit4:junit4]   2> 2748 T202 oasc.RequestHandlers.initHandlersFromConfig created lazy: solr.StandardRequestHandler
[junit4:junit4]   2> 2748 T202 oasc.RequestHandlers.initHandlersFromConfig created /update: solr.UpdateRequestHandler
[junit4:junit4]   2> 2749 T202 oasc.RequestHandlers.initHandlersFromConfig created /terms: org.apache.solr.handler.component.SearchHandler
[junit4:junit4]   2> 2749 T202 oasc.RequestHandlers.initHandlersFromConfig created spellCheckCompRH: org.apache.solr.handler.component.SearchHandler
[junit4:junit4]   2> 2750 T202 oasc.RequestHandlers.initHandlersFromConfig created spellCheckCompRH_Direct: org.apache.solr.handler.component.SearchHandler
[junit4:junit4]   2> 2750 T202 oasc.RequestHandlers.initHandlersFromConfig created spellCheckWithWordbreak: org.apache.solr.handler.component.SearchHandler
[junit4:junit4]   2> 2751 T202 oasc.RequestHandlers.initHandlersFromConfig created spellCheckWithWordbreak_Direct: org.apache.solr.handler.component.SearchHandler
[junit4:junit4]   2> 2751 T202 oasc.RequestHandlers.initHandlersFromConfig created spellCheckCompRH1: org.apache.solr.handler.component.SearchHandler
[junit4:junit4]   2> 2752 T202 oasc.RequestHandlers.initHandlersFromConfig created tvrh: org.apache.solr.handler.component.SearchHandler
[junit4:junit4]   2> 2752 T202 oasc.RequestHandlers.initHandlersFromConfig created /mlt: solr.MoreLikeThisHandler
[junit4:junit4]   2> 2753 T202 oasc.RequestHandlers.initHandlersFromConfig created /debug/dump: solr.DumpRequestHandler
[junit4:junit4]   2> 2756 T202 oashl.XMLLoader.init xsltCacheLifetimeSeconds=60
[junit4:junit4]   2> 2758 T202 oasc.SolrCore.initDeprecatedSupport WARNING solrconfig.xml uses deprecated <admin/gettableFiles>, Please update your config to use the ShowFileRequestHandler.
[junit4:junit4]   2> 2759 T202 oasc.SolrCore.initDeprecatedSupport WARNING adding ShowFileRequestHandler with hidden files: [SCHEMA.XML, OLD_SYNONYMS.TXT, STOPWORDS.TXT, PROTWORDS.TXT, OPEN-EXCHANGE-RATES.JSON, SYNONYMS.TXT, CURRENCY.XML, MAPPING-ISOLATIN1ACCENT.TXT]
[junit4:junit4]   2> 2761 T202 oass.SolrIndexSearcher.<init> Opening Searcher@75373569 main
[junit4:junit4]   2> 2762 T202 oasu.CommitTracker.<init> Hard AutoCommit: disabled
[junit4:junit4]   2> 2762 T202 oasu.CommitTracker.<init> Soft AutoCommit: disabled
[junit4:junit4]   2> 2763 T202 oashc.SpellCheckComponent.inform Initializing spell checkers
[junit4:junit4]   2> 2767 T202 oass.DirectSolrSpellChecker.init init: {name=direct,classname=DirectSolrSpellChecker,field=lowerfilt,minQueryLength=3}
[junit4:junit4]   2> 2790 T237 oasc.SolrCore.registerSearcher [collection1] Registered new searcher Searcher@75373569 main{StandardDirectoryReader(segments_1:1)}
[junit4:junit4]   2> 3102 T223 oascc.ZkStateReader.updateClusterState Updating cloud state from ZooKeeper... 
[junit4:junit4]   2> 3110 T236 oascc.ZkStateReader$2.process A cluster state change has occurred - updating...
[junit4:junit4]   2> 3110 T222 oascc.ZkStateReader$2.process A cluster state change has occurred - updating...
[junit4:junit4]   2> 3300 T202 oasc.CoreContainer.register registering core: collection1
[junit4:junit4]   2> 3300 T202 oasc.ZkController.register Register shard - core:collection1 address:http://127.0.0.1:52151/solr shardId:shard1
[junit4:junit4]   2> 3302 T202 oascc.SolrZkClient.makePath makePath: /collections/collection1/leader_elect/shard1/election
[junit4:junit4]   2> 3309 T207 oazs.PrepRequestProcessor.pRequest Got user-level KeeperException when processing sessionid:0x13a4492c1f40003 type:delete cxid:0x43 zxid:0xfffffffffffffffe txntype:unknown reqpath:n/a Error Path:/solr/collections/collection1/leaders Error:KeeperErrorCode = NoNode for /solr/collections/collection1/leaders
[junit4:junit4]   2> 3310 T202 oasc.ShardLeaderElectionContext.runLeaderProcess Running the leader process.
[junit4:junit4]   2> 3310 T207 oazs.PrepRequestProcessor.pRequest Got user-level KeeperException when processing sessionid:0x13a4492c1f40003 type:create cxid:0x44 zxid:0xfffffffffffffffe txntype:unknown reqpath:n/a Error Path:/solr/overseer Error:KeeperErrorCode = NodeExists for /solr/overseer
[junit4:junit4]   2> 3313 T202 oasc.ShardLeaderElectionContext.waitForReplicasToComeUp Enough replicas found to continue.
[junit4:junit4]   2> 3314 T202 oasc.ShardLeaderElectionContext.runLeaderProcess I may be the new leader - try and sync
[junit4:junit4]   2> 3314 T202 oasc.SyncStrategy.sync Sync replicas to http://127.0.0.1:52151/solr/collection1/
[junit4:junit4]   2> 3315 T202 oasc.SyncStrategy.syncReplicas Sync Success - now sync replicas to me
[junit4:junit4]   2> 3315 T202 oasc.SyncStrategy.syncToMe http://127.0.0.1:52151/solr/collection1/ has no replicas
[junit4:junit4]   2> 3315 T202 oasc.ShardLeaderElectionContext.runLeaderProcess I am the new leader: http://127.0.0.1:52151/solr/collection1/
[junit4:junit4]   2> 3316 T202 oascc.SolrZkClient.makePath makePath: /collections/collection1/leaders/shard1
[junit4:junit4]   2> 3321 T207 oazs.PrepRequestProcessor.pRequest Got user-level KeeperException when processing sessionid:0x13a4492c1f40003 type:create cxid:0x4e zxid:0xfffffffffffffffe txntype:unknown reqpath:n/a Error Path:/solr/overseer Error:KeeperErrorCode = NodeExists for /solr/overseer
[junit4:junit4]   2> 3613 T223 oascc.ZkStateReader.updateClusterState Updating cloud state from ZooKeeper... 
[junit4:junit4]   2> 3625 T236 oascc.ZkStateReader$2.process A cluster state change has occurred - updating...
[junit4:junit4]   2> 3625 T222 oascc.ZkStateReader$2.process A cluster state change has occurred - updating...
[junit4:junit4]   2> 3676 T202 oasc.ZkController.register We are http://127.0.0.1:52151/solr/collection1/ and leader is http://127.0.0.1:52151/solr/collection1/
[junit4:junit4]   2> 3676 T202 oasc.ZkController.register No LogReplay needed for core=collection1 baseURL=http://127.0.0.1:52151/solr
[junit4:junit4]   2> 3677 T202 oasc.ZkController.checkRecovery I am the leader, no recovery necessary
[junit4:junit4]   2> 3679 T202 oascc.ZkStateReader.updateClusterState Updating cloud state from ZooKeeper... 
[junit4:junit4]   2> 3680 T202 oass.SolrDispatchFilter.init user.dir=/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build/solr-core/test/J1
[junit4:junit4]   2> 3680 T202 oass.SolrDispatchFilter.init SolrDispatchFilter.init() done
[junit4:junit4]   2> 3681 T202 oascsi.HttpClientUtil.createClient Creating new http client, config:maxConnections=128&maxConnectionsPerHost=32&followRedirects=false
[junit4:junit4]   2> 3739 T202 oejs.Server.doStart jetty-8.1.2.v20120308
[junit4:junit4]   2> 3743 T202 oejs.AbstractConnector.doStart Started SocketConnector@0.0.0.0:51813
[junit4:junit4]   2> 3744 T202 oasc.SolrResourceLoader.locateSolrHome JNDI not configured for solr (NoInitialContextEx)
[junit4:junit4]   2> 3744 T202 oasc.SolrResourceLoader.locateSolrHome using system property solr.solr.home: /mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build/solr-core/test/J1/./org.apache.solr.cloud.RecoveryZkTest-jetty2-1349770203115
[junit4:junit4]   2> 3745 T202 oasc.SolrResourceLoader.<init> new SolrResourceLoader for deduced Solr Home: '/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build/solr-core/test/J1/./org.apache.solr.cloud.RecoveryZkTest-jetty2-1349770203115/'
[junit4:junit4]   2> 3762 T202 oass.SolrDispatchFilter.init SolrDispatchFilter.init()
[junit4:junit4]   2> 3763 T202 oasc.SolrResourceLoader.locateSolrHome JNDI not configured for solr (NoInitialContextEx)
[junit4:junit4]   2> 3763 T202 oasc.SolrResourceLoader.locateSolrHome using system property solr.solr.home: /mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build/solr-core/test/J1/./org.apache.solr.cloud.RecoveryZkTest-jetty2-1349770203115
[junit4:junit4]   2> 3764 T202 oasc.CoreContainer$Initializer.initialize looking for solr.xml: /mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build/solr-core/test/J1/./org.apache.solr.cloud.RecoveryZkTest-jetty2-1349770203115/solr.xml
[junit4:junit4]   2> 3764 T202 oasc.CoreContainer.<init> New CoreContainer 135241951
[junit4:junit4]   2> 3765 T202 oasc.CoreContainer.load Loading CoreContainer using Solr Home: '/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build/solr-core/test/J1/./org.apache.solr.cloud.RecoveryZkTest-jetty2-1349770203115/'
[junit4:junit4]   2> 3765 T202 oasc.SolrResourceLoader.<init> new SolrResourceLoader for directory: '/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build/solr-core/test/J1/./org.apache.solr.cloud.RecoveryZkTest-jetty2-1349770203115/'
[junit4:junit4]   2> 3785 T202 oasc.CoreContainer.load Registering Log Listener
[junit4:junit4]   2> 3795 T202 oasc.CoreContainer.initZooKeeper Zookeeper client=127.0.0.1:48755/solr
[junit4:junit4]   2> 3795 T202 oaz.ZooKeeper.<init> Initiating client connection, connectString=127.0.0.1:48755/solr sessionTimeout=5000 watcher=org.apache.solr.common.cloud.ConnectionManager@4bbda190
[junit4:junit4]   2> 3796 T247 oaz.ClientCnxn$SendThread.startConnect Opening socket connection to server /127.0.0.1:48755
[junit4:junit4]   2> 3796 T202 oascc.ConnectionManager.waitForConnected Waiting for client to connect to ZooKeeper
[junit4:junit4]   2> 3797 T247 oaz.ClientCnxn$SendThread.primeConnection Socket connection established to localhost.localdomain/127.0.0.1:48755, initiating session
[junit4:junit4]   2> 3797 T204 oazs.NIOServerCnxn$Factory.run Accepted socket connection from /127.0.0.1:59855
[junit4:junit4]   2> 3798 T204 oazs.NIOServerCnxn.readConnectRequest Client attempting to establish new session at /127.0.0.1:59855
[junit4:junit4]   2> 3799 T206 oazs.NIOServerCnxn.finishSessionInit Established session 0x13a4492c1f40004 with negotiated timeout 5000 for client /127.0.0.1:59855
[junit4:junit4]   2> 3799 T247 oaz.ClientCnxn$SendThread.readConnectResult Session establishment complete on server localhost.localdomain/127.0.0.1:48755, sessionid = 0x13a4492c1f40004, negotiated timeout = 5000
[junit4:junit4]   2> 3799 T248 oascc.ConnectionManager.process Watcher org.apache.solr.common.cloud.ConnectionManager@4bbda190 name:ZooKeeperConnection Watcher:127.0.0.1:48755/solr got event WatchedEvent state:SyncConnected type:None path:null path:null type:None
[junit4:junit4]   2> 3799 T202 oascc.ConnectionManager.waitForConnected Client is connected to ZooKeeper
[junit4:junit4]   2> 3800 T207 oazs.PrepRequestProcessor.pRequest Got user-level KeeperException when processing sessionid:0x13a4492c1f40004 type:create cxid:0x1 zxid:0xfffffffffffffffe txntype:unknown reqpath:n/a Error Path:/solr/overseer Error:KeeperErrorCode = NodeExists for /solr/overseer
[junit4:junit4]   2> 3801 T207 oazs.PrepRequestProcessor.pRequest Got user-level KeeperException when processing sessionid:0x13a4492c1f40004 type:create cxid:0x2 zxid:0xfffffffffffffffe txntype:unknown reqpath:n/a Error Path:/solr/overseer Error:KeeperErrorCode = NodeExists for /solr/overseer
[junit4:junit4]   2> 3802 T202 oasc.ZkController.createEphemeralLiveNode Register node as live in ZooKeeper:/live_nodes/127.0.0.1:51813_solr
[junit4:junit4]   2> 3803 T207 oazs.PrepRequestProcessor.pRequest Got user-level KeeperException when processing sessionid:0x13a4492c1f40004 type:delete cxid:0x4 zxid:0xfffffffffffffffe txntype:unknown reqpath:n/a Error Path:/solr/live_nodes/127.0.0.1:51813_solr Error:KeeperErrorCode = NoNode for /solr/live_nodes/127.0.0.1:51813_solr
[junit4:junit4]   2> 3803 T202 oascc.SolrZkClient.makePath makePath: /live_nodes/127.0.0.1:51813_solr
[junit4:junit4]   2> 3805 T236 oascc.ZkStateReader$3.process Updating live nodes
[junit4:junit4]   2> 3805 T222 oascc.ZkStateReader$3.process Updating live nodes
[junit4:junit4]   2> 3806 T202 oashc.HttpShardHandlerFactory.getParameter Setting socketTimeout to: 0
[junit4:junit4]   2> 3806 T202 oashc.HttpShardHandlerFactory.getParameter Setting urlScheme to: http://
[junit4:junit4]   2> 3807 T202 oashc.HttpShardHandlerFactory.getParameter Setting connTimeout to: 0
[junit4:junit4]   2> 3807 T202 oashc.HttpShardHandlerFactory.getParameter Setting maxConnectionsPerHost to: 20
[junit4:junit4]   2> 3807 T202 oashc.HttpShardHandlerFactory.getParameter Setting corePoolSize to: 0
[junit4:junit4]   2> 3807 T202 oashc.HttpShardHandlerFactory.getParameter Setting maximumPoolSize to: 2147483647
[junit4:junit4]   2> 3808 T202 oashc.HttpShardHandlerFactory.getParameter Setting maxThreadIdleTime to: 5
[junit4:junit4]   2> 3808 T202 oashc.HttpShardHandlerFactory.getParameter Setting sizeOfQueue to: -1
[junit4:junit4]   2> 3808 T202 oashc.HttpShardHandlerFactory.getParameter Setting fairnessPolicy to: false
[junit4:junit4]   2> 3809 T202 oascsi.HttpClientUtil.createClient Creating new http client, config:maxConnectionsPerHost=20&maxConnections=10000&socketTimeout=0&connTimeout=0&retry=false
[junit4:junit4]   2> 3816 T202 oascc.ZkStateReader.createClusterStateWatchersAndUpdate Updating cluster state from ZooKeeper... 
[junit4:junit4]   2> 3820 T202 oasc.CoreContainer.create Creating SolrCore 'collection1' using instanceDir: /mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build/solr-core/test/J1/./org.apache.solr.cloud.RecoveryZkTest-jetty2-1349770203115/collection1
[junit4:junit4]   2> 3820 T202 oasc.ZkController.createCollectionZkNode Check for collection zkNode:collection1
[junit4:junit4]   2> 3821 T202 oasc.ZkController.createCollectionZkNode Collection zkNode exists
[junit4:junit4]   2> 3821 T202 oasc.ZkController.readConfigName Load collection config from:/collections/collection1
[junit4:junit4]   2> 3822 T202 oasc.SolrResourceLoader.<init> new SolrResourceLoader for directory: '/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build/solr-core/test/J1/./org.apache.solr.cloud.RecoveryZkTest-jetty2-1349770203115/collection1/'
[junit4:junit4]   2> 3823 T202 oasc.SolrResourceLoader.replaceClassLoader Adding 'file:/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build/solr-core/test/J1/org.apache.solr.cloud.RecoveryZkTest-jetty2-1349770203115/collection1/lib/README' to classloader
[junit4:junit4]   2> 3823 T202 oasc.SolrResourceLoader.replaceClassLoader Adding 'file:/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build/solr-core/test/J1/org.apache.solr.cloud.RecoveryZkTest-jetty2-1349770203115/collection1/lib/classes/' to classloader
[junit4:junit4]   2> 3849 T202 oasc.SolrConfig.<init> Using Lucene MatchVersion: LUCENE_50
[junit4:junit4]   2> 3885 T202 oasc.SolrConfig.<init> Loaded SolrConfig: solrconfig.xml
[junit4:junit4]   2> 3886 T202 oass.IndexSchema.readSchema Reading Solr Schema
[junit4:junit4]   2> 3891 T202 oass.IndexSchema.readSchema Schema name=test
[junit4:junit4]   2> 4131 T223 oascc.ZkStateReader.updateClusterState Updating cloud state from ZooKeeper... 
[junit4:junit4]   2> 4135 T236 oascc.ZkStateReader$2.process A cluster state change has occurred - updating...
[junit4:junit4]   2> 4136 T248 oascc.ZkStateReader$2.process A cluster state change has occurred - updating...
[junit4:junit4]   2> 4135 T222 oascc.ZkStateReader$2.process A cluster state change has occurred - updating...
[junit4:junit4]   2> 4199 T202 oass.OpenExchangeRatesOrgProvider.init Initialized with rates=open-exchange-rates.json, refreshInterval=1440.
[junit4:junit4]   2> 4205 T202 oass.IndexSchema.readSchema default search field in schema is text
[junit4:junit4]   2> 4207 T202 oass.IndexSchema.readSchema unique key field: id
[junit4:junit4]   2> 4221 T202 oass.FileExchangeRateProvider.reload Reloading exchange rates from file currency.xml
[junit4:junit4]   2> 4224 T202 oass.FileExchangeRateProvider.reload Reloading exchange rates from file currency.xml
[junit4:junit4]   2> 4227 T202 oass.OpenExchangeRatesOrgProvider.reload Reloading exchange rates from open-exchange-rates.json
[junit4:junit4]   2> 4229 T202 oass.OpenExchangeRatesOrgProvider.reload Reloading exchange rates from open-exchange-rates.json
[junit4:junit4]   2> 4231 T202 oasc.SolrCore.<init> [collection1] Opening new SolrCore at /mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build/solr-core/test/J1/./org.apache.solr.cloud.RecoveryZkTest-jetty2-1349770203115/collection1/, dataDir=./org.apache.solr.cloud.RecoveryZkTest-1349770199433/jetty2/
[junit4:junit4]   2> 4231 T202 oasc.JmxMonitoredMap.<init> JMX monitoring is enabled. Adding Solr mbeans to JMX Server: com.sun.jmx.mbeanserver.JmxMBeanServer@7048dc0f
[junit4:junit4]   2> 4232 T202 oasc.SolrCore.getNewIndexDir New index directory detected: old=null new=./org.apache.solr.cloud.RecoveryZkTest-1349770199433/jetty2/index/
[junit4:junit4]   2> 4232 T202 oasc.SolrCore.initIndex WARNING [collection1] Solr index directory './org.apache.solr.cloud.RecoveryZkTest-1349770199433/jetty2/index' doesn't exist. Creating new index...
[junit4:junit4]   2> 4233 T202 oasc.CachingDirectoryFactory.get return new directory for /mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build/solr-core/test/J1/./org.apache.solr.cloud.RecoveryZkTest-1349770199433/jetty2/index forceNew:false
[junit4:junit4]   2> 4236 T202 oasc.SolrDeletionPolicy.onCommit SolrDeletionPolicy.onCommit: commits:num=1
[junit4:junit4]   2> 		commit{dir=/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build/solr-core/test/J1/org.apache.solr.cloud.RecoveryZkTest-1349770199433/jetty2/index,segFN=segments_1,generation=1,filenames=[segments_1]
[junit4:junit4]   2> 4236 T202 oasc.SolrDeletionPolicy.updateCommits newest commit = 1
[junit4:junit4]   2> 4237 T202 oasc.SolrCore.initWriters created xml: solr.XMLResponseWriter
[junit4:junit4]   2> 4239 T202 oasup.UpdateRequestProcessorChain.init inserting DistributedUpdateProcessorFactory into updateRequestProcessorChain "dedupe"
[junit4:junit4]   2> 4239 T202 oasup.UpdateRequestProcessorChain.init inserting DistributedUpdateProcessorFactory into updateRequestProcessorChain "dedupe-allfields"
[junit4:junit4]   2> 4240 T202 oasup.UpdateRequestProcessorChain.init inserting DistributedUpdateProcessorFactory into updateRequestProcessorChain "stored_sig"
[junit4:junit4]   2> 4240 T202 oasup.UpdateRequestProcessorChain.init inserting DistributedUpdateProcessorFactory into updateRequestProcessorChain "uniq-fields"
[junit4:junit4]   2> 4241 T202 oasup.UpdateRequestProcessorChain.init inserting DistributedUpdateProcessorFactory into updateRequestProcessorChain "distrib-dup-test-chain-implicit"
[junit4:junit4]   2> 4241 T202 oasc.RequestHandlers.initHandlersFromConfig adding lazy requestHandler: solr.ReplicationHandler
[junit4:junit4]   2> 4242 T202 oasc.RequestHandlers.initHandlersFromConfig created /replication: solr.ReplicationHandler
[junit4:junit4]   2> 4242 T202 oasc.RequestHandlers.initHandlersFromConfig created standard: solr.StandardRequestHandler
[junit4:junit4]   2> 4243 T202 oasc.RequestHandlers.initHandlersFromConfig created /get: solr.RealTimeGetHandler
[junit4:junit4]   2> 4243 T202 oasc.RequestHandlers.initHandlersFromConfig created dismax: solr.SearchHandler
[junit4:junit4]   2> 4244 T202 oasc.RequestHandlers.initHandlersFromConfig created mock: org.apache.solr.core.MockQuerySenderListenerReqHandler
[junit4:junit4]   2> 4244 T202 oasc.RequestHandlers.initHandlersFromConfig created /admin/: org.apache.solr.handler.admin.AdminHandlers
[junit4:junit4]   2> 4245 T202 oasc.RequestHandlers.initHandlersFromConfig created defaults: solr.StandardRequestHandler
[junit4:junit4]   2> 4245 T202 oasc.RequestHandlers.initHandlersFromConfig adding lazy requestHandler: solr.StandardRequestHandler
[junit4:junit4]   2> 4245 T202 oasc.RequestHandlers.initHandlersFromConfig created lazy: solr.StandardRequestHandler
[junit4:junit4]   2> 4246 T202 oasc.RequestHandlers.initHandlersFromConfig created /update: solr.UpdateRequestHandler
[junit4:junit4]   2> 4246 T202 oasc.RequestHandlers.initHandlersFromConfig created /terms: org.apache.solr.handler.component.SearchHandler
[junit4:junit4]   2> 4247 T202 oasc.RequestHandlers.initHandlersFromConfig created spellCheckCompRH: org.apache.solr.handler.component.SearchHandler
[junit4:junit4]   2> 4248 T202 oasc.RequestHandlers.initHandlersFromConfig created spellCheckCompRH_Direct: org.apache.solr.handler.component.SearchHandler
[junit4:junit4]   2> 4248 T202 oasc.RequestHandlers.initHandlersFromConfig created spellCheckWithWordbreak: org.apache.solr.handler.component.SearchHandler
[junit4:junit4]   2> 4249 T202 oasc.RequestHandlers.initHandlersFromConfig created spellCheckWithWordbreak_Direct: org.apache.solr.handler.component.SearchHandler
[junit4:junit4]   2> 4249 T202 oasc.RequestHandlers.initHandlersFromConfig created spellCheckCompRH1: org.apache.solr.handler.component.SearchHandler
[junit4:junit4]   2> 4250 T202 oasc.RequestHandlers.initHandlersFromConfig created tvrh: org.apache.solr.handler.component.SearchHandler
[junit4:junit4]   2> 4250 T202 oasc.RequestHandlers.initHandlersFromConfig created /mlt: solr.MoreLikeThisHandler
[junit4:junit4]   2> 4251 T202 oasc.RequestHandlers.initHandlersFromConfig created /debug/dump: solr.DumpRequestHandler
[junit4:junit4]   2> 4253 T202 oashl.XMLLoader.init xsltCacheLifetimeSeconds=60
[junit4:junit4]   2> 4255 T202 oasc.SolrCore.initDeprecatedSupport WARNING solrconfig.xml uses deprecated <admin/gettableFiles>, Please update your config to use the ShowFileRequestHandler.
[junit4:junit4]   2> 4256 T202 oasc.SolrCore.initDeprecatedSupport WARNING adding ShowFileRequestHandler with hidden files: [SCHEMA.XML, OLD_SYNONYMS.TXT, STOPWORDS.TXT, PROTWORDS.TXT, OPEN-EXCHANGE-RATES.JSON, SYNONYMS.TXT, CURRENCY.XML, MAPPING-ISOLATIN1ACCENT.TXT]
[junit4:junit4]   2> 4259 T202 oass.SolrIndexSearcher.<init> Opening Searcher@2b0ded8b main
[junit4:junit4]   2> 4259 T202 oasu.CommitTracker.<init> Hard AutoCommit: disabled
[junit4:junit4]   2> 4260 T202 oasu.CommitTracker.<init> Soft AutoCommit: disabled
[junit4:junit4]   2> 4260 T202 oashc.SpellCheckComponent.inform Initializing spell checkers
[junit4:junit4]   2> 4264 T202 oass.DirectSolrSpellChecker.init init: {name=direct,classname=DirectSolrSpellChecker,field=lowerfilt,minQueryLength=3}
[junit4:junit4]   2> 4292 T249 oasc.SolrCore.registerSearcher [collection1] Registered new searcher Searcher@2b0ded8b main{StandardDirectoryReader(segments_1:1)}
[junit4:junit4]   2> 4641 T223 oascc.ZkStateReader.updateClusterState Updating cloud state from ZooKeeper... 
[junit4:junit4]   2> 4645 T236 oascc.ZkStateReader$2.process A cluster state change has occurred - updating...
[junit4:junit4]   2> 4645 T222 oascc.ZkStateReader$2.process A cluster state change has occurred - updating...
[junit4:junit4]   2> 4645 T248 oascc.ZkStateReader$2.process A cluster state change has occurred - updating...
[junit4:junit4]   2> 4802 T202 oasc.CoreContainer.register registering core: collection1
[junit4:junit4]   2> 4803 T202 oasc.ZkController.register Register shard - core:collection1 address:http://127.0.0.1:51813/solr shardId:shard1
[junit4:junit4]   2> 4806 T202 oasc.ZkController.register We are http://127.0.0.1:51813/solr/collection1/ and leader is http://127.0.0.1:52151/solr/collection1/
[junit4:junit4]   2> 4807 T202 oasc.ZkController.register No LogReplay needed for core=collection1 baseURL=http://127.0.0.1:51813/solr
[junit4:junit4]   2> 4807 T202 oasc.ZkController.checkRecovery Core needs to recover:collection1
[junit4:junit4]   2> 4807 T202 oasu.DefaultSolrCoreState.doRecovery Running recovery - first canceling any ongoing recovery
[junit4:junit4]   2> ASYNC  NEW_CORE C15 name=collection1 org.apache.solr.core.SolrCore@2055ea0a url=http://127.0.0.1:51813/solr/collection1 node=127.0.0.1:51813_solr
[junit4:junit4]   2> 4810 T250 C15 P51813 oasc.RecoveryStrategy.run Starting recovery process.  core=collection1 recoveringAfterStartup=true
[junit4:junit4]   2> 4811 T250 C15 P51813 oasc.RecoveryStrategy.doRecovery ###### startupVersions=[]
[junit4:junit4]   2> 4811 T202 oascc.ZkStateReader.updateClusterState Updating cloud state from ZooKeeper... 
[junit4:junit4]   2> 4812 T250 C15 P51813 oasc.RecoveryStrategy.doRecovery Attempting to PeerSync from http://127.0.0.1:52151/solr/collection1/ core=collection1 - recoveringAfterStartup=true
[junit4:junit4]   2> 4812 T202 oass.SolrDispatchFilter.init user.dir=/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build/solr-core/test/J1
[junit4:junit4]   2> 4813 T202 oass.SolrDispatchFilter.init SolrDispatchFilter.init() done
[junit4:junit4]   2> 4813 T202 oascsi.HttpClientUtil.createClient Creating new http client, config:maxConnections=128&maxConnectionsPerHost=32&followRedirects=false
[junit4:junit4]   2> 4815 T250 C15 P51813 oascsi.HttpClientUtil.createClient Creating new http client, config:maxConnectionsPerHost=20&maxConnections=10000&connTimeout=30000&socketTimeout=30000&retry=false
[junit4:junit4]   2> 4817 T202 oaz.ZooKeeper.<init> Initiating client connection, connectString=127.0.0.1:48755/solr sessionTimeout=10000 watcher=org.apache.solr.common.cloud.ConnectionManager@41a14d68
[junit4:junit4]   2> 4818 T251 oaz.ClientCnxn$SendThread.startConnect Opening socket connection to server /127.0.0.1:48755
[junit4:junit4]   2> 4818 T202 oascc.ConnectionManager.waitForConnected Waiting for client to connect to ZooKeeper
[junit4:junit4]   2> 4819 T251 oaz.ClientCnxn$SendThread.primeConnection Socket connection established to localhost.localdomain/127.0.0.1:48755, initiating session
[junit4:junit4]   2> 4819 T204 oazs.NIOServerCnxn$Factory.run Accepted socket connection from /127.0.0.1:59856
[junit4:junit4]   2> 4819 T204 oazs.NIOServerCnxn.readConnectRequest Client attempting to establish new session at /127.0.0.1:59856
[junit4:junit4]   2> 4820 T250 C15 P51813 oasu.PeerSync.sync PeerSync: core=collection1 url=http://127.0.0.1:51813/solr START replicas=[http://127.0.0.1:52151/solr/collection1/] nUpdates=100
[junit4:junit4]   2> 4820 T250 C15 P51813 oasu.PeerSync.sync WARNING no frame of reference to tell of we've missed updates
[junit4:junit4]   2> 4821 T250 C15 P51813 oasc.RecoveryStrategy.doRecovery PeerSync Recovery was not successful - trying replication. core=collection1
[junit4:junit4]   2> 4821 T250 C15 P51813 oasc.RecoveryStrategy.doRecovery Starting Replication Recovery. core=collection1
[junit4:junit4]   2> 4821 T250 C15 P51813 oascsi.HttpClientUtil.createClient Creating new http client, config:maxConnections=128&maxConnectionsPerHost=32&followRedirects=false
[junit4:junit4]   2> 4822 T206 oazs.NIOServerCnxn.finishSessionInit Established session 0x13a4492c1f40005 with negotiated timeout 10000 for client /127.0.0.1:59856
[junit4:junit4]   2> 4822 T251 oaz.ClientCnxn$SendThread.readConnectResult Session establishment complete on server localhost.localdomain/127.0.0.1:48755, sessionid = 0x13a4492c1f40005, negotiated timeout = 10000
[junit4:junit4]   2> 4823 T252 oascc.ConnectionManager.process Watcher org.apache.solr.common.cloud.ConnectionManager@41a14d68 name:ZooKeeperConnection Watcher:127.0.0.1:48755/solr got event WatchedEvent state:SyncConnected type:None path:null path:null type:None
[junit4:junit4]   2> ASYNC  NEW_CORE C16 name=collection1 org.apache.solr.core.SolrCore@763b9f5c url=http://127.0.0.1:52151/solr/collection1 node=127.0.0.1:52151_solr
[junit4:junit4]   2> 4828 T228 C16 P52151 REQ /get {distrib=false&qt=/get&wt=javabin&version=2&getVersions=100} status=0 QTime=0 
[junit4:junit4]   2> 4827 T202 oascc.ConnectionManager.waitForConnected Client is connected to ZooKeeper
[junit4:junit4]   2> 4830 T202 oascc.ZkStateReader.createClusterStateWatchersAndUpdate Updating cluster state from ZooKeeper... 
[junit4:junit4]   2> 4832 T202 oasc.ChaosMonkey.monkeyLog monkey: init - expire sessions:true cause connection loss:true
[junit4:junit4]   2> 4833 T202 oascsi.HttpClientUtil.createClient Creating new http client, config:
[junit4:junit4]   2> 4837 T202 oascc.ZkStateReader.updateClusterState Updating cloud state from ZooKeeper... 
[junit4:junit4]   2> ASYNC  NEW_CORE C17 name=collection1 org.apache.solr.core.SolrCore@54f4f8f1 url=http://127.0.0.1:39071/solr/collection1 node=127.0.0.1:39071_solr
[junit4:junit4]   2> 4849 T215 C17 P39071 oascsi.HttpClientUtil.createClient Creating new http client, config:maxConnections=500&maxConnectionsPerHost=16
[junit4:junit4]   2> 4855 T215 C17 P39071 oasc.SolrDeletionPolicy.onInit SolrDeletionPolicy.onInit: commits:num=1
[junit4:junit4]   2> 		commit{dir=/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build/solr-core/test/J1/org.apache.solr.cloud.RecoveryZkTest-1349770199433/control/data/index,segFN=segments_1,generation=1,filenames=[segments_1]
[junit4:junit4]   2> 4856 T215 C17 P39071 oasc.SolrDeletionPolicy.updateCommits newest commit = 1
[junit4:junit4]   2> 4858 T215 C17 P39071 /update {wt=javabin&version=2} {add=[10001 (1415336641725202432)]} 0 12
[junit4:junit4]   2> 4859 T214 C17 P39071 /update {wt=javabin&version=2} {add=[1 (1415336641725202433)]} 0 12
[junit4:junit4]   2> 4859 T255 oaz.ZooKeeper.<init> Initiating client connection, connectString=127.0.0.1:48755/solr sessionTimeout=10000 watcher=org.apache.solr.common.cloud.ConnectionManager@4ffea259
[junit4:junit4]   2> 4862 T255 oascc.ConnectionManager.waitForConnected Waiting for client to connect to ZooKeeper
[junit4:junit4]   2> 4862 T256 oaz.ClientCnxn$SendThread.startConnect Opening socket connection to server /127.0.0.1:48755
[junit4:junit4]   2> 4863 T256 oaz.ClientCnxn$SendThread.primeConnection Socket connection established to localhost.localdomain/127.0.0.1:48755, initiating session
[junit4:junit4]   2> 4863 T204 oazs.NIOServerCnxn$Factory.run Accepted socket connection from /127.0.0.1:59862
[junit4:junit4]   2> 4863 T204 oazs.NIOServerCnxn.readConnectRequest Client attempting to establish new session at /127.0.0.1:59862
[junit4:junit4]   2> 4864 T206 oazs.NIOServerCnxn.finishSessionInit Established session 0x13a4492c1f40006 with negotiated timeout 10000 for client /127.0.0.1:59862
[junit4:junit4]   2> 4864 T256 oaz.ClientCnxn$SendThread.readConnectResult Session establishment complete on server localhost.localdomain/127.0.0.1:48755, sessionid = 0x13a4492c1f40006, negotiated timeout = 10000
[junit4:junit4]   2> 4864 T257 oascc.ConnectionManager.process Watcher org.apache.solr.common.cloud.ConnectionManager@4ffea259 name:ZooKeeperConnection Watcher:127.0.0.1:48755/solr got event WatchedEvent state:SyncConnected type:None path:null path:null type:None
[junit4:junit4]   2> 4865 T255 oascc.ConnectionManager.waitForConnected Client is connected to ZooKeeper
[junit4:junit4]   2> 4865 T255 oascc.ZkStateReader.createClusterStateWatchersAndUpdate Updating cluster state from ZooKeeper... 
[junit4:junit4]   2> 4872 T230 C16 P52151 oasc.SolrDeletionPolicy.onInit SolrDeletionPolicy.onInit: commits:num=1
[junit4:junit4]   2> 		commit{dir=/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build/solr-core/test/J1/org.apache.solr.cloud.RecoveryZkTest-1349770199433/jetty1/index,segFN=segments_1,generation=1,filenames=[segments_1]
[junit4:junit4]   2> 4872 T230 C16 P52151 oasc.SolrDeletionPolicy.updateCommits newest commit = 1
[junit4:junit4]   2> 4876 T230 C16 P52151 /update {wt=javabin&version=2} {add=[1 (1415336641743028224)]} 0 7
[junit4:junit4]   2> 4876 T231 C16 P52151 /update {wt=javabin&version=2} {add=[10001 (1415336641743028225)]} 0 7
[junit4:junit4]   2> 4880 T215 C17 P39071 /update {wt=javabin&version=2} {add=[10002 (1415336641752465408)]} 0 2
[junit4:junit4]   2> 4880 T214 C17 P39071 /update {wt=javabin&version=2} {add=[2 (1415336641752465409)]} 0 2
[junit4:junit4]   2> 4884 T231 C16 P52151 /update {wt=javabin&version=2} {add=[10002 (1415336641756659712)]} 0 1
[junit4:junit4]   2> 4884 T230 C16 P52151 /update {wt=javabin&version=2} {add=[2 (1415336641756659713)]} 0 1
[junit4:junit4]   2> 4891 T215 C17 P39071 /update {wt=javabin&version=2} {delete=[2 (-1415336641765048320)]} 0 3
[junit4:junit4]   2> 4894 T214 C17 P39071 /update {wt=javabin&version=2} {delete=[10002 (-1415336641767145472)]} 0 2
[junit4:junit4]   2> 4897 T230 C16 P52151 /update {wt=javabin&version=2} {delete=[10002 (-1415336641771339776)]} 0 1
[junit4:junit4]   2> 4897 T231 C16 P52151 /update {wt=javabin&version=2} {delete=[2 (-1415336641771339777)]} 0 1
[junit4:junit4]   2> 4901 T214 C17 P39071 /update {wt=javabin&version=2} {add=[10003 (1415336641774485504)]} 0 1
[junit4:junit4]   2> 4902 T215 C17 P39071 /update {wt=javabin&version=2} {add=[3 (1415336641774485505)]} 0 2
[junit4:junit4]   2> 4906 T230 C16 P52151 /update {wt=javabin&version=2} {add=[3 (1415336641779728385)]} 0 1
[junit4:junit4]   2> 4906 T231 C16 P52151 /update {wt=javabin&version=2} {add=[10003 (1415336641779728384)]} 0 2
[junit4:junit4]   2> 4910 T214 C17 P39071 /update {wt=javabin&version=2} {add=[10004 (1415336641783922688)]} 0 1
[junit4:junit4]   2> 4911 T215 C17 P39071 /update {wt=javabin&version=2} {add=[4 (1415336641783922689)]} 0 2
[junit4:junit4]   2> 4914 T230 C16 P52151 /update {wt=javabin&version=2} {add=[10004 (1415336641788116992)]} 0 1
[junit4:junit4]   2> 4915 T231 C16 P52151 /update {wt=javabin&version=2} {add=[4 (1415336641789165568)]} 0 1
[junit4:junit4]   2> 4918 T215 C17 P39071 /update {wt=javabin&version=2} {delete=[10003 (-1415336641793359872)]} 0 1
[junit4:junit4]   2> 4918 T214 C17 P39071 /update {wt=javabin&version=2} {delete=[3 (-1415336641793359873)]} 0 0
[junit4:junit4]   2> 4922 T231 C16 P52151 /update {wt=javabin&version=2} {delete=[10003 (-1415336641796505600)]} 0 1
[junit4:junit4]   2> 4922 T230 C16 P52151 /update {wt=javabin&version=2} {delete=[3 (-1415336641797554176)]} 0 1
[junit4:junit4]   2> 4927 T214 C17 P39071 /update {wt=javabin&version=2} {add=[10005 (1415336641800699904)]} 0 2
[junit4:junit4]   2> 4932 T230 C16 P52151 /update {wt=javabin&version=2} {add=[10005 (1415336641805942784)]} 0 2
[junit4:junit4]   2> 4938 T214 C17 P39071 /update {wt=javabin&version=2} {add=[10006 (1415336641812234240)]} 0 3
[junit4:junit4]   2> 4940 T215 C17 P39071 /update {wt=javabin&version=2} {add=[5 (1415336641802797056)]} 0 15
[junit4:junit4]   2> 4944 T230 C16 P52151 /update {wt=javabin&version=2} {add=[10006 (1415336641818525696)]} 0 1
[junit4:junit4]   2> 4945 T231 C16 P52151 /update {wt=javabin&version=2} {add=[5 (1415336641820622848)]} 0 2
[junit4:junit4]   2> 4948 T215 C17 P39071 /update {wt=javabin&version=2} {add=[10007 (1415336641823768576)]} 0 1
[junit4:junit4]   2> 4950 T214 C17 P39071 /update {wt=javabin&version=2} {add=[6 (1415336641825865728)]} 0 2
[junit4:junit4]   2> 4953 T231 C16 P52151 /update {wt=javabin&version=2} {add=[10007 (1415336641829011456)]} 0 2
[junit4:junit4]   2> 4954 T230 C16 P52151 /update {wt=javabin&version=2} {add=[6 (1415336641830060032)]} 0 1
[junit4:junit4]   2> 4958 T214 C17 P39071 /update {wt=javabin&version=2} {add=[10008 (1415336641833205760)]} 0 2
[junit4:junit4]   2> 4958 T215 C17 P39071 /update {wt=javabin&version=2} {add=[7 (1415336641834254336)]} 0 1
[junit4:junit4]   2> 4963 T230 C16 P52151 /update {wt=javabin&version=2} {add=[7 (1415336641838448640)]} 0 2
[junit4:junit4]   2> 4963 T231 C16 P52151 /update {wt=javabin&version=2} {add=[10008 (1415336641838448641)]} 0 2
[junit4:junit4]   2> 4966 T215 C17 P39071 /update {wt=javabin&version=2} {delete=[10005 (-1415336641843691520)]} 0 0
[junit4:junit4]   2> 4968 T214 C17 P39071 /update {wt=javabin&version=2} {add=[8 (1415336641843691521)]} 0 2
[junit4:junit4]   2> 4971 T230 C16 P52151 /update {wt=javabin&version=2} {delete=[10005 (-1415336641847885824)]} 0 1
[junit4:junit4]   2> 4973 T231 C16 P52151 /update {wt=javabin&version=2} {add=[8 (1415336641848934400)]} 0 2
[junit4:junit4]   2> 4975 T214 C17 P39071 /update {wt=javabin&version=2} {add=[10009 (1415336641852080128)]} 0 1
[junit4:junit4]   2> 4976 T215 C17 P39071 /update {wt=javabin&version=2} {delete=[5 (-1415336641854177280)]} 0 0
[junit4:junit4]   2> 4979 T230 C16 P52151 /update {wt=javabin&version=2} {delete=[5 (-1415336641857323009)]} 0 0
[junit4:junit4]   2> 4980 T231 C16 P52151 /update {wt=javabin&version=2} {add=[10009 (1415336641857323008)]} 0 2
[junit4:junit4]   2> 4983 T214 C17 P39071 /update {wt=javabin&version=2} {delete=[10007 (-1415336641861517312)]} 0 1
[junit4:junit4]   2> 4984 T215 C17 P39071 /update {wt=javabin&version=2} {add=[9 (1415336641860468736)]} 0 2
[junit4:junit4]   2> 4987 T231 C16 P52151 /update {wt=javabin&version=2} {delete=[10007 (-1415336641864663040)]} 0 1
[junit4:junit4]   2> 4988 T230 C16 P52151 /update {wt=javabin&version=2} {add=[9 (1415336641865711616)]} 0 1
[junit4:junit4]   2> 4991 T215 C17 P39071 /update {wt=javabin&version=2} {add=[10010 (1415336641868857344)]} 0 1
[junit4:junit4]   2> 4992 T214 C17 P39071 /update {wt=javabin&version=2} {delete=[7 (-1415336641870954496)]} 0 1
[junit4:junit4]   2> 4995 T231 C16 P52151 /update {wt=javabin&version=2} {delete=[7 (-1415336641874100224)]} 0 1
[junit4:junit4]   2> 5009 T214 C17 P39071 /update {wt=javabin&version=2} {add=[10 (1415336641877245952)]} 0 11
[junit4:junit4]   2> 5009 T230 C16 P52151 /update {wt=javabin&version=2} {add=[10010 (1415336641874100225)]} 0 15
[junit4:junit4]   2> 5012 T214 C17 P39071 /update {wt=javabin&version=2} {delete=[10008 (-1415336641891926016)]} 0 0
[junit4:junit4]   2> 5015 T230 C16 P52151 /update {wt=javabin&version=2} {delete=[10008 (-1415336641895071744)]} 0 0
[junit4:junit4]   2> 5020 T214 C17 P39071 /update {wt=javabin&version=2} {add=[10011 (1415336641899266048)]} 0 2
[junit4:junit4]   2> 5026 T230 C16 P52151 /update {wt=javabin&version=2} {add=[10011 (1415336641904508928)]} 0 3
[junit4:junit4]   2> 5027 T231 C16 P52151 /update {wt=javabin&version=2} {add=[10 (1415336641891926016)]} 0 15
[junit4:junit4]   2> 5034 T215 C17 P39071 /update {wt=javabin&version=2} {delete=[8 (-1415336641914994688)]} 0 4
[junit4:junit4]   2> 5034 T214 C17 P39071 /update {wt=javabin&version=2} {add=[10012 (1415336641909751808)]} 0 5
[junit4:junit4]   2> 5038 T231 C16 P52151 /update {wt=javabin&version=2} {delete=[8 (-1415336641919188992)]} 0 1
[junit4:junit4]   2> 5039 T230 C16 P52151 /update {wt=javabin&version=2} {add=[10012 (1415336641919188993)]} 0 2
[junit4:junit4]   2> 5043 T214 C17 P39071 /update {wt=javabin&version=2} {add=[11 (1415336641923383296)]} 0 2
[junit4:junit4]   2> 5044 T215 C17 P39071 /update {wt=javabin&version=2} {add=[10013 (1415336641923383297)]} 0 2
[junit4:junit4]   2> 5048 T230 C16 P52151 /update {wt=javabin&version=2} {add=[11 (1415336641927577601)]} 0 2
[junit4:junit4]   2> 5048 T231 C16 P52151 /update {wt=javabin&version=2} {add=[10013 (1415336641927577600)]} 0 2
[junit4:junit4]   2> 5052 T215 C17 P39071 /update {wt=javabin&version=2} {add=[10014 (1415336641932820480)]} 0 1
[junit4:junit4]   2> 5053 T214 C17 P39071 /update {wt=javabin&version=2} {add=[12 (1415336641932820481)]} 0 2
[junit4:junit4]   2> 5056 T231 C16 P52151 /update {wt=javabin&version=2} {add=[10014 (1415336641937014784)]} 0 1
[junit4:junit4]   2> 5057 T230 C16 P52151 /update {wt=javabin&version=2} {add=[12 (1415336641938063360)]} 0 2
[junit4:junit4]   2> 5059 T214 C17 P39071 /update {wt=javabin&version=2} {delete=[10009 (-1415336641941209088)]} 0 1
[junit4:junit4]   2> 5060 T215 C17 P39071 /update {wt=javabin&version=2} {add=[13 (1415336641941209089)]} 0 1
[junit4:junit4]   2> 5062 T230 C16 P52151 /update {wt=javabin&version=2} {delete=[10009 (-1415336641944354816)]} 0 0
[junit4:junit4]   2> 5064 T231 C16 P52151 /update {wt=javabin&version=2} {add=[13 (1415336641945403392)]} 0 1
[junit4:junit4]   2> 5066 T215 C17 P39071 /update {wt=javabin&version=2} {add=[10015 (1415336641947500544)]} 0 1
[junit4:junit4]   2> 5068 T214 C17 P39071 /update {wt=javabin&version=2} {add=[14 (1415336641949597696)]} 0 2
[junit4:junit4]   2> 5070 T231 C16 P52151 /update {wt=javabin&version=2} {add=[10015 (1415336641951694848)]} 0 1
[junit4:junit4]   2> 5071 T230 C16 P52151 /update {wt=javabin&version=2} {add=[14 (1415336641952743424)]} 0 1
[junit4:junit4]   2> 5074 T215 C17 P39071 /update {wt=javabin&version=2} {delete=[9 (-1415336641956937728)]} 0 0
[junit4:junit4]   2> 5077 T230 C16 P52151 /update {wt=javabin&version=2} {delete=[9 (-1415336641960083456)]} 0 1
[junit4:junit4]   2> 5081 T215 C17 P39071 /update {wt=javabin&version=2} {add=[15 (1415336641963229184)]} 0 2
[junit4:junit4]   2> 5082 T214 C17 P39071 /update {wt=javabin&version=2} {add=[10016 (1415336641955889152)]} 0 10
[junit4:junit4]   2> 5086 T231 C16 P52151 /update {wt=javabin&version=2} {add=[10016 (1415336641968472065)]} 0 2
[junit4:junit4]   2> 5086 T230 C16 P52151 /update {wt=javabin&version=2} {add=[15 (1415336641968472064)]} 0 2
[junit4:junit4]   2> 5089 T214 C17 P39071 /update {wt=javabin&version=2} {delete=[10011 (-1415336641972666368)]} 0 0
[junit4:junit4]   2> 5090 T215 C17 P39071 /update {wt=javabin&version=2} {add=[16 (1415336641972666369)]} 0 1
[junit4:junit4]   2> 5092 T230 C16 P52151 /update {wt=javabin&version=2} {delete=[10011 (-1415336641975812096)]} 0 0
[junit4:junit4]   2> 5094 T231 C16 P52151 /update {wt=javabin&version=2} {add=[16 (1415336641976860672)]} 0 2
[junit4:junit4]   2> 5097 T214 C17 P39071 /update {wt=javabin&version=2} {delete=[11 (-1415336641980006401)]} 0 1
[junit4:junit4]   2> 5097 T215 C17 P39071 /update {wt=javabin&version=2} {add=[10017 (1415336641980006400)]} 0 2
[junit4:junit4]   2> 5100 T231 C16 P52151 /update {wt=javabin&version=2} {delete=[11 (-1415336641984200704)]} 0 0
[junit4:junit4]   2> 5102 T230 C16 P52151 /update {wt=javabin&version=2} {add=[10017 (1415336641985249280)]} 0 2
[junit4:junit4]   2> 5104 T214 C17 P39071 /update {wt=javabin&version=2} {delete=[10012 (-1415336641988395009)]} 0 0
[junit4:junit4]   2> 5104 T215 C17 P39071 /update {wt=javabin&version=2} {add=[17 (1415336641988395008)]} 0 1
[junit4:junit4]   2> 5107 T230 C16 P52151 /update {wt=javabin&version=2} {delete=[10012 (-1415336641991540736)]} 0 0
[junit4:junit4]   2> 5108 T231 C16 P52151 /update {wt=javabin&version=2} {add=[17 (1415336641991540737)]} 0 1
[junit4:junit4]   2> 5111 T214 C17 P39071 /update {wt=javabin&version=2} {delete=[12 (-1415336641994686465)]} 0 1
[junit4:junit4]   2> 5112 T215 C17 P39071 /update {wt=javabin&version=2} {add=[10018 (1415336641994686464)]} 0 2
[junit4:junit4]   2> 5114 T231 C16 P52151 /update {wt=javabin&version=2} {delete=[12 (-1415336641998880768)]} 0 1
[junit4:junit4]   2> 5116 T230 C16 P52151 /update {wt=javabin&version=2} {add=[10018 (1415336641999929344)]} 0 1
[junit4:junit4]   2> 5118 T215 C17 P39071 /update {wt=javabin&version=2} {add=[18 (1415336642002026496)]} 0 1
[junit4:junit4]   2> 5120 T214 C17 P39071 /update {wt=javabin&version=2} {add=[10019 (1415336642005172224)]} 0 1
[junit4:junit4]   2> 5123 T230 C16 P52151 /update {wt=javabin&version=2} {add=[18 (1415336642007269376)]} 0 1
[junit4:junit4]   2> 5125 T231 C16 P52151 /update {wt=javabin&version=2} {add=[10019 (1415336642009366528)]} 0 1
[junit4:junit4]   2> 5127 T214 C17 P39071 /update {wt=javabin&version=2} {add=[19 (1415336642011463680)]} 0 1
[junit4:junit4]   2> 5130 T215 C17 P39071 /update {wt=javabin&version=2} {add=[10020 (1415336642014609408)]} 0 2
[junit4:junit4]   2> 5132 T231 C16 P52151 /update {wt=javabin&version=2} {add=[19 (1415336642016706560)]} 0 2
[junit4:junit4]   2> 5146 T230 C16 P52151 /update {wt=javabin&version=2} {add=[10020 (1415336642018803712)]} 0 14
[junit4:junit4]   2> 5149 T223 oascc.ZkStateReader.updateClusterState Updating cloud state from ZooKeeper... 
[junit4:junit4]   2> 5150 T215 C17 P39071 /update {wt=javabin&version=2} {add=[20 (1415336642021949440)]} 0 14
[junit4:junit4]   2> 5152 T214 C17 P39071 /update {wt=javabin&version=2} {add=[10021 (1415336642035580928)]} 0 3
[junit4:junit4]   2> 5154 T252 oascc.ZkStateReader$2.process A cluster state change has occurred - updating...
[junit4:junit4]   2> 5155 T222 oascc.ZkStateReader$2.process A cluster state change has occurred - updating...
[junit4:junit4]   2> 5157 T236 oascc.ZkStateReader$2.process A cluster state change has occurred - updating...
[junit4:junit4]   2> 5157 T230 C16 P52151 /update {wt=javabin&version=2} {add=[20 (1415336642040823808)]} 0 4
[junit4:junit4]   2> 5155 T257 oascc.ZkStateReader$2.process A cluster state change has occurred - updating...
[junit4:junit4]   2> 5154 T248 oascc.ZkStateReader$2.process A cluster state change has occurred - updating...
[junit4:junit4]   2> 5164 T214 C17 P39071 /update {wt=javabin&version=2} {add=[21 (1415336642050260992)]} 0 2
[junit4:junit4]   2> 5170 T231 C16 P52151 /update {wt=javabin&version=2} {add=[10021 (1415336642042920960)]} 0 15
[junit4:junit4]   2> 5176 T214 C17 P39071 /update {wt=javabin&version=2} {add=[10022 (1415336642061795328)]} 0 2
[junit4:junit4]   2>  C15_STATE=coll:collection1 core:collection1 props:{shard=shard1, roles=null, state=recovering, core=collection1, collection=collection1, node_name=127.0.0.1:51813_solr, base_url=http://127.0.0.1:51813/solr}
[junit4:junit4]   2> 5190 T240 C15 P51813 oasc.SolrDeletionPolicy.onInit SolrDeletionPolicy.onInit: commits:num=1
[junit4:junit4]   2> 		commit{dir=/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build/solr-core/test/J1/org.apache.solr.cloud.RecoveryZkTest-1349770199433/jetty2/index,segFN=segments_1,generation=1,filenames=[segments_1]
[junit4:junit4]   2> 5191 T240 C15 P51813 oasc.SolrDeletionPolicy.updateCommits newest commit = 1
[junit4:junit4]   2> 5194 T241 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=6 
[junit4:junit4]   2> 5194 T240 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=7 
[junit4:junit4]   2> 5195 T231 C16 P52151 /update {wt=javabin&version=2} {add=[10022 (1415336642067038208)]} 0 16
[junit4:junit4]   2> 5195 T230 C16 P52151 /update {wt=javabin&version=2} {add=[21 (1415336642057601024)]} 0 28
[junit4:junit4]   2> 5198 T214 C17 P39071 /update {wt=javabin&version=2} {delete=[10015 (-1415336642086961152)]} 0 1
[junit4:junit4]   2> 5199 T215 C17 P39071 /update {wt=javabin&version=2} {add=[22 (1415336642086961153)]} 0 1
[junit4:junit4]   2> 5206 T240 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=1 
[junit4:junit4]   2> 5207 T230 C16 P52151 /update {wt=javabin&version=2} {delete=[10015 (-1415336642091155456)]} 0 6
[junit4:junit4]   2> 5207 T241 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=2 
[junit4:junit4]   2> 5208 T231 C16 P52151 /update {wt=javabin&version=2} {add=[22 (1415336642091155457)]} 0 6
[junit4:junit4]   2> 5210 T214 C17 P39071 /update {wt=javabin&version=2} {delete=[15 (-1415336642099544064)]} 0 0
[junit4:junit4]   2> 5212 T215 C17 P39071 /update {wt=javabin&version=2} {add=[10023 (1415336642099544065)]} 0 2
[junit4:junit4]   2> 5218 T241 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=1 
[junit4:junit4]   2> 5219 T231 C16 P52151 /update {wt=javabin&version=2} {delete=[15 (-1415336642102689792)]} 0 6
[junit4:junit4]   2> 5220 T240 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=2 
[junit4:junit4]   2> 5221 T230 C16 P52151 /update {wt=javabin&version=2} {add=[10023 (1415336642104786944)]} 0 7
[junit4:junit4]   2> 5223 T215 C17 P39071 /update {wt=javabin&version=2} {add=[23 (1415336642112126976)]} 0 1
[junit4:junit4]   2> 5224 T214 C17 P39071 /update {wt=javabin&version=2} {delete=[10019 (-1415336642114224128)]} 0 0
[junit4:junit4]   2> 5230 T240 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=1 
[junit4:junit4]   2> 5232 T241 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=2 
[junit4:junit4]   2> 5233 T231 C16 P52151 /update {wt=javabin&version=2} {delete=[10019 (-1415336642117369856)]} 0 6
[junit4:junit4]   2> 5236 T230 C16 P52151 /update {wt=javabin&version=2} {add=[23 (1415336642117369857)]} 0 10
[junit4:junit4]   2> 5237 T214 C17 P39071 /update {wt=javabin&version=2} {add=[10024 (1415336642126807040)]} 0 1
[junit4:junit4]   2> 5240 T215 C17 P39071 /update {wt=javabin&version=2} {delete=[19 (-1415336642129952768)]} 0 1
[junit4:junit4]   2> 5245 T241 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=1 
[junit4:junit4]   2> 5245 T240 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=0 
[junit4:junit4]   2> 5246 T230 C16 P52151 /update {wt=javabin&version=2} {add=[10024 (1415336642131001344)]} 0 6
[junit4:junit4]   2> 5246 T231 C16 P52151 /update {wt=javabin&version=2} {delete=[19 (-1415336642134147072)]} 0 4
[junit4:junit4]   2> 5250 T215 C17 P39071 /update {wt=javabin&version=2} {delete=[10021 (-1415336642141487104)]} 0 1
[junit4:junit4]   2> 5251 T214 C17 P39071 /update {wt=javabin&version=2} {add=[24 (1415336642141487105)]} 0 2
[junit4:junit4]   2> 5256 T240 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=1 
[junit4:junit4]   2> 5257 T231 C16 P52151 /update {wt=javabin&version=2} {delete=[10021 (-1415336642144632832)]} 0 4
[junit4:junit4]   2> 5260 T241 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=1 
[junit4:junit4]   2> 5261 T214 C17 P39071 /update {wt=javabin&version=2} {add=[10025 (1415336642151972864)]} 0 1
[junit4:junit4]   2> 5261 T230 C16 P52151 /update {wt=javabin&version=2} {add=[24 (1415336642145681408)]} 0 7
[junit4:junit4]   2> 5265 T214 C17 P39071 /update {wt=javabin&version=2} {delete=[21 (-1415336642157215744)]} 0 1
[junit4:junit4]   2> 5270 T241 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=2 
[junit4:junit4]   2> 5271 T230 C16 P52151 /update {wt=javabin&version=2} {add=[10025 (1415336642157215744)]} 0 7
[junit4:junit4]   2> 5271 T240 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=0 
[junit4:junit4]   2> 5272 T231 C16 P52151 /update {wt=javabin&version=2} {delete=[21 (-1415336642160361472)]} 0 4
[junit4:junit4]   2> 5277 T215 C17 P39071 /update {wt=javabin&version=2} {add=[25 (1415336642167701504)]} 0 2
[junit4:junit4]   2> 5286 T240 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=2 
[junit4:junit4]   2> 5287 T231 C16 P52151 /update {wt=javabin&version=2} {add=[25 (1415336642173992960)]} 0 7
[junit4:junit4]   2> 5288 T214 C17 P39071 /update {wt=javabin&version=2} {add=[10026 (1415336642166652928)]} 0 14
[junit4:junit4]   2> 5292 T215 C17 P39071 /update {wt=javabin&version=2} {add=[26 (1415336642183430144)]} 0 2
[junit4:junit4]   2> 5302 T241 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=3 
[junit4:junit4]   2> 5303 T230 C16 P52151 /update {wt=javabin&version=2} {add=[26 (1415336642189721600)]} 0 8
[junit4:junit4]   2> 5311 T215 C17 P39071 /update {wt=javabin&version=2} {add=[27 (1415336642203353088)]} 0 5
[junit4:junit4]   2> 5314 T240 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=20 
[junit4:junit4]   2> 5315 T231 C16 P52151 /update {wt=javabin&version=2} {add=[10026 (1415336642184478720)]} 0 25
[junit4:junit4]   2> 5319 T240 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=1 
[junit4:junit4]   2> 5320 T215 C17 P39071 /update {wt=javabin&version=2} {add=[10027 (1415336642213838848)]} 0 2
[junit4:junit4]   2> 5320 T230 C16 P52151 /update {wt=javabin&version=2} {add=[27 (1415336642209644544)]} 0 6
[junit4:junit4]   2> 5325 T215 C17 P39071 /update {wt=javabin&version=2} {add=[28 (1415336642219081728)]} 0 2
[junit4:junit4]   2> 5328 T240 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=1 
[junit4:junit4]   2> 5328 T231 C16 P52151 /update {wt=javabin&version=2} {add=[10027 (1415336642218033152)]} 0 5
[junit4:junit4]   2> 5332 T215 C17 P39071 /update {wt=javabin&version=2} {add=[10028 (1415336642226421760)]} 0 1
[junit4:junit4]   2> 5339 T240 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=1 
[junit4:junit4]   2> 5340 T231 C16 P52151 /update {wt=javabin&version=2} {add=[10028 (1415336642230616064)]} 0 5
[junit4:junit4]   2> 5343 T215 C17 P39071 /update {wt=javabin&version=2} {delete=[10023 (-1415336642239004672)]} 0 1
[junit4:junit4]   2> 5348 T240 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=3 
[junit4:junit4]   2> 5349 T230 C16 P52151 /update {wt=javabin&version=2} {add=[28 (1415336642223276032)]} 0 21
[junit4:junit4]   2> 5350 T241 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=0 
[junit4:junit4]   2> 5351 T231 C16 P52151 /update {wt=javabin&version=2} {delete=[10023 (-1415336642243198976)]} 0 5
[junit4:junit4]   2> 5352 T215 C17 P39071 /update {wt=javabin&version=2} {delete=[23 (-1415336642248441856)]} 0 0
[junit4:junit4]   2> 5354 T214 C17 P39071 /update {wt=javabin&version=2} {add=[10029 (1415336642250539008)]} 0 1
[junit4:junit4]   2> 5358 T241 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=1 
[junit4:junit4]   2> 5360 T231 C16 P52151 /update {wt=javabin&version=2} {delete=[23 (-1415336642251587584)]} 0 5
[junit4:junit4]   2> 5363 T241 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=1 
[junit4:junit4]   2> 5364 T214 C17 P39071 /update {wt=javabin&version=2} {add=[29 (1415336642259976192)]} 0 2
[junit4:junit4]   2> 5365 T230 C16 P52151 /update {wt=javabin&version=2} {add=[10029 (1415336642254733312)]} 0 8
[junit4:junit4]   2> 5368 T214 C17 P39071 /update {wt=javabin&version=2} {add=[10030 (1415336642264170496)]} 0 1
[junit4:junit4]   2> 5372 T241 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=2 
[junit4:junit4]   2> 5372 T231 C16 P52151 /update {wt=javabin&version=2} {add=[29 (1415336642264170496)]} 0 5
[junit4:junit4]   2> 5376 T241 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=2 
[junit4:junit4]   2> 5377 T230 C16 P52151 /update {wt=javabin&version=2} {add=[10030 (1415336642268364800)]} 0 6
[junit4:junit4]   2> 5383 T215 C17 P39071 /update {wt=javabin&version=2} {add=[10031 (1415336642278850560)]} 0 2
[junit4:junit4]   2> 5388 T214 C17 P39071 /update {wt=javabin&version=2} {add=[30 (1415336642273607680)]} 0 13
[junit4:junit4]   2> 5392 T241 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=1 
[junit4:junit4]   2> 5393 T230 C16 P52151 /update {wt=javabin&version=2} {add=[10031 (1415336642285142016)]} 0 6
[junit4:junit4]   2> 5398 T214 C17 P39071 /update {wt=javabin&version=2} {add=[10032 (1415336642295627776)]} 0 2
[junit4:junit4]   2> 5407 T240 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=12 
[junit4:junit4]   2> 5408 T231 C16 P52151 /update {wt=javabin&version=2} {add=[30 (1415336642289336320)]} 0 17
[junit4:junit4]   2> 5411 T241 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=3 
[junit4:junit4]   2> 5412 T230 C16 P52151 /update {wt=javabin&version=2} {add=[10032 (1415336642300870656)]} 0 11
[junit4:junit4]   2> 5413 T214 C17 P39071 /update {wt=javabin&version=2} {add=[31 (1415336642310307840)]} 0 2
[junit4:junit4]   2> 5417 T215 C17 P39071 /update {wt=javabin&version=2} {add=[10033 (1415336642314502144)]} 0 2
[junit4:junit4]   2> 5420 T241 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=1 
[junit4:junit4]   2> 5422 T230 C16 P52151 /update {wt=javabin&version=2} {add=[31 (1415336642315550720)]} 0 7
[junit4:junit4]   2> 5426 T215 C17 P39071 /update {wt=javabin&version=2} {add=[32 (1415336642324987904)]} 0 2
[junit4:junit4]   2> 5427 T240 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=4 
[junit4:junit4]   2> 5427 T231 C16 P52151 /update {wt=javabin&version=2} {add=[10033 (1415336642319745024)]} 0 7
[junit4:junit4]   2> 5434 T215 C17 P39071 /update {wt=javabin&version=2} {add=[10034 (1415336642331279360)]} 0 4
[junit4:junit4]   2> 5435 T240 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=2 
[junit4:junit4]   2> 5436 T230 C16 P52151 /update {wt=javabin&version=2} {add=[32 (1415336642330230784)]} 0 7
[junit4:junit4]   2> 5441 T215 C17 P39071 /update {wt=javabin&version=2} {add=[33 (1415336642340716544)]} 0 2
[junit4:junit4]   2> 5452 T240 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=2 
[junit4:junit4]   2> 5453 T230 C16 P52151 /update {wt=javabin&version=2} {add=[33 (1415336642345959424)]} 0 9
[junit4:junit4]   2> 5456 T215 C17 P39071 /update {wt=javabin&version=2} {add=[34 (1415336642356445184)]} 0 1
[junit4:junit4]   2> 5457 T240 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=1 
[junit4:junit4]   2> 5458 T231 C16 P52151 /update {wt=javabin&version=2} {add=[10034 (1415336642338619392)]} 0 21
[junit4:junit4]   2> 5461 T215 C17 P39071 /update {wt=javabin&version=2} {delete=[10024 (-1415336642362736640)]} 0 0
[junit4:junit4]   2> 5465 T240 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=2 
[junit4:junit4]   2> 5466 T230 C16 P52151 /update {wt=javabin&version=2} {add=[34 (1415336642360639488)]} 0 7
[junit4:junit4]   2> 5467 T241 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=0 
[junit4:junit4]   2> 5468 T231 C16 P52151 /update {wt=javabin&version=2} {delete=[10024 (-1415336642365882368)]} 0 4
[junit4:junit4]   2> 5469 T215 C17 P39071 /update {wt=javabin&version=2} {delete=[24 (-1415336642370076672)]} 0 1
[junit4:junit4]   2> 5473 T214 C17 P39071 /update {wt=javabin&version=2} {add=[10035 (1415336642373222400)]} 0 2
[junit4:junit4]   2> 5474 T241 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=0 
[junit4:junit4]   2> 5475 T231 C16 P52151 /update {wt=javabin&version=2} {delete=[24 (-1415336642373222400)]} 0 4
[junit4:junit4]   2> 5480 T241 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=1 
[junit4:junit4]   2> 5481 T230 C16 P52151 /update {wt=javabin&version=2} {add=[10035 (1415336642378465280)]} 0 5
[junit4:junit4]   2> 5485 T215 C17 P39071 /update {wt=javabin&version=2} {add=[10036 (1415336642386853888)]} 0 2
[junit4:junit4]   2> 5492 T214 C17 P39071 /update {wt=javabin&version=2} {add=[35 (1415336642379513856)]} 0 15
[junit4:junit4]   2> 5502 T241 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=2 
[junit4:junit4]   2> 5503 T231 C16 P52151 /update {wt=javabin&version=2} {add=[35 (1415336642398388224)]} 0 8
[junit4:junit4]   2> 5507 T214 C17 P39071 /update {wt=javabin&version=2} {add=[36 (1415336642409922560)]} 0 1
[junit4:junit4]   2> 5516 T241 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=2 
[junit4:junit4]   2> 5516 T231 C16 P52151 /update {wt=javabin&version=2} {add=[36 (1415336642415165440)]} 0 6
[junit4:junit4]   2> 5518 T240 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=14 
[junit4:junit4]   2> 5519 T230 C16 P52151 /update {wt=javabin&version=2} {add=[10036 (1415336642392096768)]} 0 31
[junit4:junit4]   2> 5522 T214 C17 P39071 /update {wt=javabin&version=2} {delete=[26 (-1415336642426699776)]} 0 3
[junit4:junit4]   2> 5525 T215 C17 P39071 /update {wt=javabin&version=2} {delete=[10026 (-1415336642429845504)]} 0 1
[junit4:junit4]   2> 5528 T240 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=1 
[junit4:junit4]   2> 5528 T230 C16 P52151 /update {wt=javabin&version=2} {delete=[26 (-1415336642429845504)]} 0 4
[junit4:junit4]   2> 5531 T240 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=1 
[junit4:junit4]   2> 5531 T231 C16 P52151 /update {wt=javabin&version=2} {delete=[10026 (-1415336642432991232)]} 0 3
[junit4:junit4]   2> 5532 T215 C17 P39071 /update {wt=javabin&version=2} {add=[37 (1415336642436136960)]} 0 1
[junit4:junit4]   2> 5536 T214 C17 P39071 /update {wt=javabin&version=2} {add=[10037 (1415336642439282688)]} 0 2
[junit4:junit4]   2> 5540 T240 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=2 
[junit4:junit4]   2> 5541 T231 C16 P52151 /update {wt=javabin&version=2} {add=[37 (1415336642440331264)]} 0 6
[junit4:junit4]   2> 5545 T240 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=2 
[junit4:junit4]   2> 5545 T214 C17 P39071 /update {wt=javabin&version=2} {add=[38 (1415336642449768448)]} 0 2
[junit4:junit4]   2> 5546 T230 C16 P52151 /update {wt=javabin&version=2} {add=[10037 (1415336642444525568)]} 0 8
[junit4:junit4]   2> 5549 T214 C17 P39071 /update {wt=javabin&version=2} {add=[10038 (1415336642453962752)]} 0 1
[junit4:junit4]   2> 5554 T240 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=2 
[junit4:junit4]   2> 5554 T231 C16 P52151 /update {wt=javabin&version=2} {add=[38 (1415336642453962752)]} 0 6
[junit4:junit4]   2> 5557 T214 C17 P39071 /update {wt=javabin&version=2} {delete=[31 (-1415336642463399936)]} 0 0
[junit4:junit4]   2> 5557 T241 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=1 
[junit4:junit4]   2> 5558 T230 C16 P52151 /update {wt=javabin&version=2} {add=[10038 (1415336642458157056)]} 0 6
[junit4:junit4]   2> 5561 T214 C17 P39071 /update {wt=javabin&version=2} {delete=[10031 (-1415336642467594240)]} 0 0
[junit4:junit4]   2> 5563 T241 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=0 
[junit4:junit4]   2> 5564 T231 C16 P52151 /update {wt=javabin&version=2} {delete=[31 (-1415336642466545664)]} 0 4
[junit4:junit4]   2> 5568 T214 C17 P39071 /update {wt=javabin&version=2} {add=[39 (1415336642473885696)]} 0 2
[junit4:junit4]   2> 5568 T241 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=0 
[junit4:junit4]   2> 5569 T230 C16 P52151 /update {wt=javabin&version=2} {delete=[10031 (-1415336642471788544)]} 0 5
[junit4:junit4]   2> 5573 T214 C17 P39071 /update {wt=javabin&version=2} {add=[10039 (1415336642479128576)]} 0 1
[junit4:junit4]   2> 5576 T241 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=2 
[junit4:junit4]   2> 5576 T231 C16 P52151 /update {wt=javabin&version=2} {add=[39 (1415336642478080000)]} 0 6
[junit4:junit4]   2> 5579 T214 C17 P39071 /update {wt=javabin&version=2} {delete=[34 (-1415336642486468608)]} 0 0
[junit4:junit4]   2> 5580 T241 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=1 
[junit4:junit4]   2> 5581 T230 C16 P52151 /update {wt=javabin&version=2} {add=[10039 (1415336642483322880)]} 0 6
[junit4:junit4]   2> 5584 T214 C17 P39071 /update {wt=javabin&version=2} {delete=[10034 (-1415336642491711488)]} 0 1
[junit4:junit4]   2> 5589 T240 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=0 
[junit4:junit4]   2> 5589 T241 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=0 
[junit4:junit4]   2> 5590 T230 C16 P52151 /update {wt=javabin&version=2} {delete=[10034 (-1415336642494857216)]} 0 4
[junit4:junit4]   2> 5590 T231 C16 P52151 /update {wt=javabin&version=2} {delete=[34 (-1415336642489614336)]} 0 8
[junit4:junit4]   2> 5599 T214 C17 P39071 /update {wt=javabin&version=2} {add=[40 (1415336642506391552)]} 0 1
[junit4:junit4]   2> 5607 T241 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=1 
[junit4:junit4]   2> 5608 T231 C16 P52151 /update {wt=javabin&version=2} {add=[40 (1415336642510585856)]} 0 6
[junit4:junit4]   2> 5613 T214 C17 P39071 /update {wt=javabin&version=2} {add=[41 (1415336642520023040)]} 0 2
[junit4:junit4]   2> 5621 T241 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=1 
[junit4:junit4]   2> 5622 T231 C16 P52151 /update {wt=javabin&version=2} {add=[41 (1415336642525265920)]} 0 6
[junit4:junit4]   2> 5626 T214 C17 P39071 /update {wt=javabin&version=2} {add=[42 (1415336642534703104)]} 0 1
[junit4:junit4]   2> 5650 T241 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=17 
[junit4:junit4]   2> 5651 T231 C16 P52151 /update {wt=javabin&version=2} {add=[42 (1415336642538897408)]} 0 22
[junit4:junit4]   2> 5655 T214 C17 P39071 /update {wt=javabin&version=2} {add=[43 (1415336642565111808)]} 0 2
[junit4:junit4]   2> 5664 T241 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=2 
[junit4:junit4]   2> 5665 T231 C16 P52151 /update {wt=javabin&version=2} {add=[43 (1415336642569306112)]} 0 7
[junit4:junit4]   2> 5669 T214 C17 P39071 /update {wt=javabin&version=2} {add=[44 (1415336642579791872)]} 0 1
[junit4:junit4]   2> 5699 T215 C17 P39071 /update {wt=javabin&version=2} {add=[10040 (1415336642506391553)]} 0 101
[junit4:junit4]   2> 5708 T241 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=1 
[junit4:junit4]   2> 5710 T230 C16 P52151 /update {wt=javabin&version=2} {add=[10040 (1415336642616492032)]} 0 8
[junit4:junit4]   2> 5715 T215 C17 P39071 /update {wt=javabin&version=2} {add=[10041 (1415336642626977792)]} 0 2
[junit4:junit4]   2> 5724 T241 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=2 
[junit4:junit4]   2> 5725 T230 C16 P52151 /update {wt=javabin&version=2} {add=[10041 (1415336642632220672)]} 0 7
[junit4:junit4]   2> 5729 T215 C17 P39071 /update {wt=javabin&version=2} {add=[10042 (1415336642642706432)]} 0 1
[junit4:junit4]   2> 5738 T241 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=1 
[junit4:junit4]   2> 5739 T240 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=2 
[junit4:junit4]   2> 5740 T230 C16 P52151 /update {wt=javabin&version=2} {add=[10042 (1415336642647949312)]} 0 7
[junit4:junit4]   2> 5740 T231 C16 P52151 /update {wt=javabin&version=2} {add=[44 (1415336642583986176)]} 0 68
[junit4:junit4]   2> 5744 T215 C17 P39071 /update {wt=javabin&version=2} {add=[10043 (1415336642658435072)]} 0 1
[junit4:junit4]   2> 5745 T214 C17 P39071 /update {wt=javabin&version=2} {add=[45 (1415336642659483648)]} 0 2
[junit4:junit4]   2> 5754 T240 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=2 
[junit4:junit4]   2> 5755 T230 C16 P52151 /update {wt=javabin&version=2} {add=[45 (1415336642663677953)]} 0 7
[junit4:junit4]   2> 5756 T241 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=2 
[junit4:junit4]   2> 5756 T231 C16 P52151 /update {wt=javabin&version=2} {add=[10043 (1415336642663677952)]} 0 8
[junit4:junit4]   2> 5767 T214 C17 P39071 /update {wt=javabin&version=2} {delete=[37 (-1415336642683600896)]} 0 10
[junit4:junit4]   2> 5774 T241 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=1 
[junit4:junit4]   2> 5775 T231 C16 P52151 /update {wt=javabin&version=2} {delete=[37 (-1415336642686746624)]} 0 5
[junit4:junit4]   2> 5776 T215 C17 P39071 /update {wt=javabin&version=2} {add=[10044 (1415336642690940928)]} 0 2
[junit4:junit4]   2> 5784 T241 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=2 
[junit4:junit4]   2> 5785 T231 C16 P52151 /update {wt=javabin&version=2} {add=[10044 (1415336642696183808)]} 0 7
[junit4:junit4]   2> 5790 T215 C17 P39071 /update {wt=javabin&version=2} {add=[10045 (1415336642705620992)]} 0 2
[junit4:junit4]   2> 5793 T214 C17 P39071 /update {wt=javabin&version=2} {add=[46 (1415336642695135232)]} 0 16
[junit4:junit4]   2> 5799 T241 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=2 
[junit4:junit4]   2> 5800 T231 C16 P52151 /update {wt=javabin&version=2} {add=[10045 (1415336642711912448)]} 0 6
[junit4:junit4]   2> 5803 T214 C17 P39071 /update {wt=javabin&version=2} {delete=[10037 (-1415336642721349632)]} 0 0
[junit4:junit4]   2> 5809 T241 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=0 
[junit4:junit4]   2> 5810 T231 C16 P52151 /update {wt=javabin&version=2} {delete=[10037 (-1415336642725543936)]} 0 4
[junit4:junit4]   2> 5815 T214 C17 P39071 /update {wt=javabin&version=2} {add=[10046 (1415336642732883968)]} 0 2
[junit4:junit4]   2> 5817 T240 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=18 
[junit4:junit4]   2> 5821 T230 C16 P52151 /update {wt=javabin&version=2} {add=[46 (1415336642714009600)]} 0 25
[junit4:junit4]   2> 5824 T214 C17 P39071 /update {wt=javabin&version=2} {delete=[39 (-1415336642743369728)]} 0 0
[junit4:junit4]   2> 5824 T241 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=2 
[junit4:junit4]   2> 5825 T231 C16 P52151 /update {wt=javabin&version=2} {add=[10046 (1415336642737078272)]} 0 7
[junit4:junit4]   2> 5829 T214 C17 P39071 /update {wt=javabin&version=2} {delete=[10039 (-1415336642747564032)]} 0 1
[junit4:junit4]   2> 5831 T241 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=1 
[junit4:junit4]   2> 5832 T230 C16 P52151 /update {wt=javabin&version=2} {delete=[39 (-1415336642746515456)]} 0 5
[junit4:junit4]   2> 5836 T214 C17 P39071 /update {wt=javabin&version=2} {add=[47 (1415336642754904064)]} 0 1
[junit4:junit4]   2> 5837 T241 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=0 
[junit4:junit4]   2> 5838 T231 C16 P52151 /update {wt=javabin&version=2} {delete=[10039 (-1415336642753855488)]} 0 4
[junit4:junit4]   2> 5842 T214 C17 P39071 /update {wt=javabin&version=2} {add=[10047 (1415336642761195520)]} 0 1
[junit4:junit4]   2> 5844 T241 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=1 
[junit4:junit4]   2> 5844 T230 C16 P52151 /update {wt=javabin&version=2} {add=[47 (1415336642759098368)]} 0 5
[junit4:junit4]   2> 5848 T214 C17 P39071 /update {wt=javabin&version=2} {delete=[40 (-1415336642767486976)]} 0 1
[junit4:junit4]   2> 5849 T241 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=1 
[junit4:junit4]   2> 5850 T231 C16 P52151 /update {wt=javabin&version=2} {add=[10047 (1415336642765389824)]} 0 5
[junit4:junit4]   2> 5852 T214 C17 P39071 /update {wt=javabin&version=2} {delete=[10040 (-1415336642772729856)]} 0 0
[junit4:junit4]   2> 5853 T241 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=0 
[junit4:junit4]   2> 5854 T230 C16 P52151 /update {wt=javabin&version=2} {delete=[40 (-1415336642771681280)]} 0 3
[junit4:junit4]   2> 5858 T241 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=1 
[junit4:junit4]   2> 5858 T214 C17 P39071 /update {wt=javabin&version=2} {add=[48 (1415336642777972736)]} 0 2
[junit4:junit4]   2> 5858 T231 C16 P52151 /update {wt=javabin&version=2} {delete=[10040 (-1415336642775875584)]} 0 3
[junit4:junit4]   2> 5862 T214 C17 P39071 /update {wt=javabin&version=2} {add=[10048 (1415336642782167040)]} 0 1
[junit4:junit4]   2> 5869 T241 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=1 
[junit4:junit4]   2> 5869 T231 C16 P52151 /update {wt=javabin&version=2} {add=[10048 (1415336642786361344)]} 0 5
[junit4:junit4]   2> 5872 T214 C17 P39071 /update {wt=javabin&version=2} {delete=[10041 (-1415336642793701376)]} 0 0
[junit4:junit4]   2> 5877 T240 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=0 
[junit4:junit4]   2> 5878 T241 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=1 
[junit4:junit4]   2> 5878 T231 C16 P52151 /update {wt=javabin&version=2} {delete=[10041 (-1415336642796847104)]} 0 3
[junit4:junit4]   2> 5879 T230 C16 P52151 /update {wt=javabin&version=2} {add=[48 (1415336642782167040)]} 0 18
[junit4:junit4]   2> 5882 T215 C17 P39071 /update {wt=javabin&version=2} {delete=[41 (-1415336642804187136)]} 0 1
[junit4:junit4]   2> 5883 T214 C17 P39071 /update {wt=javabin&version=2} {add=[10049 (1415336642803138560)]} 0 2
[junit4:junit4]   2> 5888 T241 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=1 
[junit4:junit4]   2> 5889 T230 C16 P52151 /update {wt=javabin&version=2} {delete=[41 (-1415336642807332864)]} 0 4
[junit4:junit4]   2> 5889 T240 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=1 
[junit4:junit4]   2> 5890 T231 C16 P52151 /update {wt=javabin&version=2} {add=[10049 (1415336642807332865)]} 0 5
[junit4:junit4]   2> 5892 T214 C17 P39071 /update {wt=javabin&version=2} {add=[49 (1415336642814672896)]} 0 1
[junit4:junit4]   2> 5893 T215 C17 P39071 /update {wt=javabin&version=2} {delete=[10042 (-1415336642815721472)]} 0 0
[junit4:junit4]   2> 5898 T240 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=0 
[junit4:junit4]   2> 5899 T230 C16 P52151 /update {wt=javabin&version=2} {delete=[10042 (-1415336642818867201)]} 0 3
[junit4:junit4]   2> 5900 T241 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=2 
[junit4:junit4]   2> 5900 T231 C16 P52151 /update {wt=javabin&version=2} {add=[49 (1415336642818867200)]} 0 5
[junit4:junit4]   2> 5903 T214 C17 P39071 /update {wt=javabin&version=2} {delete=[42 (-1415336642826207233)]} 0 0
[junit4:junit4]   2> 5904 T215 C17 P39071 /update {wt=javabin&version=2} {add=[10050 (1415336642826207232)]} 0 2
[junit4:junit4]   2> 5909 T241 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=0 
[junit4:junit4]   2> 5910 T231 C16 P52151 /update {wt=javabin&version=2} {delete=[42 (-1415336642830401536)]} 0 4
[junit4:junit4]   2> 5913 T240 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=2 
[junit4:junit4]   2> 5914 T230 C16 P52151 /update {wt=javabin&version=2} {add=[10050 (1415336642830401537)]} 0 7
[junit4:junit4]   2> 5919 T214 C17 P39071 /update {wt=javabin&version=2} {add=[10051 (1415336642840887296)]} 0 2
[junit4:junit4]   2> 5922 T215 C17 P39071 /update {wt=javabin&version=2} {add=[50 (1415336642836692992)]} 0 10
[junit4:junit4]   2> 5928 T240 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=2 
[junit4:junit4]   2> 5929 T230 C16 P52151 /update {wt=javabin&version=2} {add=[10051 (1415336642847178752)]} 0 6
[junit4:junit4]   2> 5932 T215 C17 P39071 /update {wt=javabin&version=2} {add=[10052 (1415336642855567360)]} 0 1
[junit4:junit4]   2> 5936 T241 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=9 
[junit4:junit4]   2> 5937 T231 C16 P52151 /update {wt=javabin&version=2} {add=[50 (1415336642848227328)]} 0 13
[junit4:junit4]   2> 5941 T240 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=3 
[junit4:junit4]   2> 5941 T215 C17 P39071 /update {wt=javabin&version=2} {add=[51 (1415336642865004544)]} 0 1
[junit4:junit4]   2> 5941 T230 C16 P52151 /update {wt=javabin&version=2} {add=[10052 (1415336642859761664)]} 0 6
[junit4:junit4]   2> 5945 T215 C17 P39071 /update {wt=javabin&version=2} {add=[10053 (1415336642869198848)]} 0 1
[junit4:junit4]   2> 5952 T240 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=1 
[junit4:junit4]   2> 5953 T230 C16 P52151 /update {wt=javabin&version=2} {add=[10053 (1415336642873393152)]} 0 6
[junit4:junit4]   2> 5955 T241 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=1 
[junit4:junit4]   2> 5956 T215 C17 P39071 /update {wt=javabin&version=2} {delete=[10044 (-1415336642880733184)]} 0 1
[junit4:junit4]   2> 5956 T231 C16 P52151 /update {wt=javabin&version=2} {add=[51 (1415336642868150272)]} 0 13
[junit4:junit4]   2> 5959 T215 C17 P39071 /update {wt=javabin&version=2} {add=[52 (1415336642883878912)]} 0 1
[junit4:junit4]   2> 5961 T241 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=1 
[junit4:junit4]   2> 5961 T231 C16 P52151 /update {wt=javabin&version=2} {delete=[10044 (-1415336642883878912)]} 0 3
[junit4:junit4]   2> 5965 T215 C17 P39071 /update {wt=javabin&version=2} {add=[10054 (1415336642890170368)]} 0 1
[junit4:junit4]   2> 5966 T241 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=1 
[junit4:junit4]   2> 5966 T230 C16 P52151 /update {wt=javabin&version=2} {add=[52 (1415336642888073216)]} 0 4
[junit4:junit4]   2> 5969 T215 C17 P39071 /update {wt=javabin&version=2} {add=[53 (1415336642895413248)]} 0 1
[junit4:junit4]   2> 5973 T241 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=1 
[junit4:junit4]   2> 5973 T231 C16 P52151 /update {wt=javabin&version=2} {add=[10054 (1415336642894364672)]} 0 5
[junit4:junit4]   2> 5976 T240 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=1 
[junit4:junit4]   2> 5976 T215 C17 P39071 /update {wt=javabin&version=2} {delete=[10047 (-1415336642902753280)]} 0 0
[junit4:junit4]   2> 5976 T230 C16 P52151 /update {wt=javabin&version=2} {add=[53 (1415336642898558976)]} 0 4
[junit4:junit4]   2> 5979 T215 C17 P39071 /update {wt=javabin&version=2} {delete=[44 (-1415336642905899008)]} 0 0
[junit4:junit4]   2> 5981 T240 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=0 
[junit4:junit4]   2> 5982 T231 C16 P52151 /update {wt=javabin&version=2} {delete=[10047 (-1415336642905899008)]} 0 3
[junit4:junit4]   2> 5984 T241 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=0 
[junit4:junit4]   2> 5985 T230 C16 P52151 /update {wt=javabin&version=2} {delete=[44 (-1415336642907996160)]} 0 4
[junit4:junit4]   2> 5987 T215 C17 P39071 /update {wt=javabin&version=2} {add=[10055 (1415336642913239040)]} 0 1
[junit4:junit4]   2> 5989 T214 C17 P39071 /update {wt=javabin&version=2} {add=[54 (1415336642915336192)]} 0 2
[junit4:junit4]   2> 5995 T241 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=1 
[junit4:junit4]   2> 5996 T240 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=2 
[junit4:junit4]   2> 5996 T230 C16 P52151 /update {wt=javabin&version=2} {add=[10055 (1415336642917433344)]} 0 6
[junit4:junit4]   2> 5996 T231 C16 P52151 /update {wt=javabin&version=2} {add=[54 (1415336642918481920)]} 0 5
[junit4:junit4]   2> 5999 T215 C17 P39071 /update {wt=javabin&version=2} {delete=[47 (-1415336642926870529)]} 0 0
[junit4:junit4]   2> 6005 T240 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=0 
[junit4:junit4]   2> 6006 T231 C16 P52151 /update {wt=javabin&version=2} {delete=[47 (-1415336642930016256)]} 0 4
[junit4:junit4]   2> 6010 T214 C17 P39071 /update {wt=javabin&version=2} {add=[10056 (1415336642926870528)]} 0 11
[junit4:junit4]   2> 6012 T215 C17 P39071 /update {wt=javabin&version=2} {add=[55 (1415336642938404864)]} 0 3
[junit4:junit4]   2> 6025 T240 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=1 
[junit4:junit4]   2> 6025 T231 C16 P52151 /update {wt=javabin&version=2} {add=[10056 (1415336642942599168)]} 0 12
[junit4:junit4]   2> 6030 T215 C17 P39071 /update {wt=javabin&version=2} {add=[10057 (1415336642959376384)]} 0 1
[junit4:junit4]   2> 6034 T241 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=10 
[junit4:junit4]   2> 6035 T230 C16 P52151 /update {wt=javabin&version=2} {add=[55 (1415336642942599169)]} 0 21
[junit4:junit4]   2> 6039 T215 C17 P39071 /update {wt=javabin&version=2} {add=[56 (1415336642967764992)]} 0 2
[junit4:junit4]   2> 6039 T241 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=2 
[junit4:junit4]   2> 6040 T231 C16 P52151 /update {wt=javabin&version=2} {add=[10057 (1415336642963570688)]} 0 7
[junit4:junit4]   2> 6043 T215 C17 P39071 /update {wt=javabin&version=2} {delete=[10049 (-1415336642973007872)]} 0 0
[junit4:junit4]   2> 6047 T241 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=1 
[junit4:junit4]   2> 6048 T230 C16 P52151 /update {wt=javabin&version=2} {add=[56 (1415336642971959296)]} 0 6
[junit4:junit4]   2> 6049 T240 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=1 
[junit4:junit4]   2> 6049 T231 C16 P52151 /update {wt=javabin&version=2} {delete=[10049 (-1415336642976153600)]} 0 3
[junit4:junit4]   2> 6052 T215 C17 P39071 /update {wt=javabin&version=2} {add=[57 (1415336642981396480)]} 0 1
[junit4:junit4]   2> 6053 T214 C17 P39071 /update {wt=javabin&version=2} {add=[10058 (1415336642982445056)]} 0 1
[junit4:junit4]   2> 6059 T240 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=1 
[junit4:junit4]   2> 6060 T231 C16 P52151 /update {wt=javabin&version=2} {add=[57 (1415336642985590784)]} 0 5
[junit4:junit4]   2> 6062 T214 C17 P39071 /update {wt=javabin&version=2} {delete=[49 (-1415336642992930816)]} 0 0
[junit4:junit4]   2> 6068 T240 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=1 
[junit4:junit4]   2> 6069 T231 C16 P52151 /update {wt=javabin&version=2} {delete=[49 (-1415336642996076544)]} 0 4
[junit4:junit4]   2> 6072 T240 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=1 
[junit4:junit4]   2> 6073 T214 C17 P39071 /update {wt=javabin&version=2} {add=[58 (1415336643003416576)]} 0 1
[junit4:junit4]   2> 6073 T230 C16 P52151 /update {wt=javabin&version=2} {add=[10058 (1415336642986639360)]} 0 18
[junit4:junit4]   2> 6076 T214 C17 P39071 /update {wt=javabin&version=2} {delete=[10050 (-1415336643007610880)]} 0 0
[junit4:junit4]   2> 6080 T240 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=1 
[junit4:junit4]   2> 6080 T231 C16 P52151 /update {wt=javabin&version=2} {add=[58 (1415336643007610880)]} 0 4
[junit4:junit4]   2> 6082 T241 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=1 
[junit4:junit4]   2> 6082 T230 C16 P52151 /update {wt=javabin&version=2} {delete=[10050 (-1415336643010756608)]} 0 3
[junit4:junit4]   2> 6083 T214 C17 P39071 /update {wt=javabin&version=2} {delete=[50 (-1415336643014950912)]} 0 0
[junit4:junit4]   2> 6086 T215 C17 P39071 /update {wt=javabin&version=2} {add=[10059 (1415336643017048064)]} 0 1
[junit4:junit4]   2> 6088 T241 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=1 
[junit4:junit4]   2> 6088 T230 C16 P52151 /update {wt=javabin&version=2} {delete=[50 (-1415336643017048064)]} 0 3
[junit4:junit4]   2> 6092 T215 C17 P39071 /update {wt=javabin&version=2} {add=[59 (1415336643023339520)]} 0 1
[junit4:junit4]   2> 6093 T241 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=1 
[junit4:junit4]   2> 6094 T231 C16 P52151 /update {wt=javabin&version=2} {add=[10059 (1415336643021242368)]} 0 5
[junit4:junit4]   2> 6098 T215 C17 P39071 /update {wt=javabin&version=2} {add=[10060 (1415336643029630976)]} 0 1
[junit4:junit4]   2> 6100 T241 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=1 
[junit4:junit4]   2> 6101 T230 C16 P52151 /update {wt=javabin&version=2} {add=[59 (1415336643027533824)]} 0 6
[junit4:junit4]   2> 6106 T241 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=2 
[junit4:junit4]   2> 6107 T231 C16 P52151 /update {wt=javabin&version=2} {add=[10060 (1415336643033825280)]} 0 6
[junit4:junit4]   2> 6112 T214 C17 P39071 /update {wt=javabin&version=2} {add=[10061 (1415336643043262464)]} 0 2
[junit4:junit4]   2> 6112 T215 C17 P39071 /update {wt=javabin&version=2} {add=[60 (1415336643035922432)]} 0 9
[junit4:junit4]   2> 6120 T241 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=1 
[junit4:junit4]   2> 6121 T231 C16 P52151 /update {wt=javabin&version=2} {add=[60 (1415336643048505344)]} 0 6
[junit4:junit4]   2> 6125 T214 C17 P39071 /update {wt=javabin&version=2} {add=[61 (1415336643057942528)]} 0 1
[junit4:junit4]   2> 6146 T241 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=2 
[junit4:junit4]   2> 6147 T231 C16 P52151 /update {wt=javabin&version=2} {add=[61 (1415336643063185408)]} 0 19
[junit4:junit4]   2> 6152 T214 C17 P39071 /update {wt=javabin&version=2} {add=[62 (1415336643086254080)]} 0 2
[junit4:junit4]   2> 6162 T241 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=1 
[junit4:junit4]   2> 6163 T231 C16 P52151 /update {wt=javabin&version=2} {add=[62 (1415336643090448384)]} 0 8
[junit4:junit4]   2> 6167 T214 C17 P39071 /update {wt=javabin&version=2} {add=[63 (1415336643101982720)]} 0 2
[junit4:junit4]   2> 6176 T241 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=2 
[junit4:junit4]   2> 6177 T231 C16 P52151 /update {wt=javabin&version=2} {add=[63 (1415336643106177024)]} 0 7
[junit4:junit4]   2> 6181 T214 C17 P39071 /update {wt=javabin&version=2} {add=[64 (1415336643116662784)]} 0 2
[junit4:junit4]   2> 6184 T240 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=65 
[junit4:junit4]   2> 6185 T230 C16 P52151 /update {wt=javabin&version=2} {add=[10061 (1415336643048505345)]} 0 70
[junit4:junit4]   2> 6189 T214 C17 P39071 /update {wt=javabin&version=2} {add=[10062 (1415336643125051392)]} 0 2
[junit4:junit4]   2> 6189 T240 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=1 
[junit4:junit4]   2> 6190 T231 C16 P52151 /update {wt=javabin&version=2} {add=[64 (1415336643120857088)]} 0 6
[junit4:junit4]   2> 6193 T214 C17 P39071 /update {wt=javabin&version=2} {add=[65 (1415336643129245696)]} 0 1
[junit4:junit4]   2> 6196 T240 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=1 
[junit4:junit4]   2> 6197 T230 C16 P52151 /update {wt=javabin&version=2} {add=[10062 (1415336643129245696)]} 0 6
[junit4:junit4]   2> 6200 T240 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=1 
[junit4:junit4]   2> 6201 T214 C17 P39071 /update {wt=javabin&version=2} {add=[10063 (1415336643137634304)]} 0 1
[junit4:junit4]   2> 6201 T231 C16 P52151 /update {wt=javabin&version=2} {add=[65 (1415336643133440000)]} 0 5
[junit4:junit4]   2> 6204 T214 C17 P39071 /update {wt=javabin&version=2} {delete=[55 (-1415336643141828608)]} 0 0
[junit4:junit4]   2> 6208 T240 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=1 
[junit4:junit4]   2> 6209 T230 C16 P52151 /update {wt=javabin&version=2} {add=[10063 (1415336643141828608)]} 0 5
[junit4:junit4]   2> 6210 T241 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=0 
[junit4:junit4]   2> 6211 T231 C16 P52151 /update {wt=javabin&version=2} {delete=[55 (-1415336643144974336)]} 0 4
[junit4:junit4]   2> 6213 T214 C17 P39071 /update {wt=javabin&version=2} {add=[10064 (1415336643150217216)]} 0 1
[junit4:junit4]   2> 6221 T241 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=1 
[junit4:junit4]   2> 6222 T231 C16 P52151 /update {wt=javabin&version=2} {add=[10064 (1415336643155460096)]} 0 6
[junit4:junit4]   2> 6224 T215 C17 P39071 /update {wt=javabin&version=2} {add=[66 (1415336643151265792)]} 0 11
[junit4:junit4]   2> 6227 T214 C17 P39071 /update {wt=javabin&version=2} {add=[10065 (1415336643164897280)]} 0 2
[junit4:junit4]   2> 6232 T241 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=2 
[junit4:junit4]   2> 6233 T231 C16 P52151 /update {wt=javabin&version=2} {add=[66 (1415336643166994432)]} 0 6
[junit4:junit4]   2> 6235 T214 C17 P39071 /update {wt=javabin&version=2} {delete=[64 (-1415336643174334464)]} 0 0
[junit4:junit4]   2> 6242 T241 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=1 
[junit4:junit4]   2> 6243 T231 C16 P52151 /update {wt=javabin&version=2} {delete=[64 (-1415336643178528768)]} 0 5
[junit4:junit4]   2> 6245 T240 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=11 
[junit4:junit4]   2> 6246 T230 C16 P52151 /update {wt=javabin&version=2} {add=[10065 (1415336643170140160)]} 0 16
[junit4:junit4]   2> 6247 T214 C17 P39071 /update {wt=javabin&version=2} {add=[67 (1415336643185868800)]} 0 1
[junit4:junit4]   2> 6249 T215 C17 P39071 /update {wt=javabin&version=2} {delete=[10055 (-1415336643189014528)]} 0 0
[junit4:junit4]   2> 6254 T241 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=0 
[junit4:junit4]   2> 6255 T231 C16 P52151 /update {wt=javabin&version=2} {delete=[10055 (-1415336643192160256)]} 0 3
[junit4:junit4]   2> 6257 T240 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=3 
[junit4:junit4]   2> 6257 T230 C16 P52151 /update {wt=javabin&version=2} {add=[67 (1415336643190063104)]} 0 7
[junit4:junit4]   2> 6259 T215 C17 P39071 /update {wt=javabin&version=2} {add=[10066 (1415336643199500288)]} 0 1
[junit4:junit4]   2> 6260 T214 C17 P39071 /update {wt=javabin&version=2} {delete=[65 (-1415336643200548864)]} 0 0
[junit4:junit4]   2> 6265 T240 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=0 
[junit4:junit4]   2> 6267 T231 C16 P52151 /update {wt=javabin&version=2} {delete=[65 (-1415336643203694593)]} 0 5
[junit4:junit4]   2> 6268 T241 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=2 
[junit4:junit4]   2> 6268 T230 C16 P52151 /update {wt=javabin&version=2} {add=[10066 (1415336643203694592)]} 0 6
[junit4:junit4]   2> 6271 T214 C17 P39071 /update {wt=javabin&version=2} {add=[68 (1415336643211034624)]} 0 2
[junit4:junit4]   2> 6271 T215 C17 P39071 /update {wt=javabin&version=2} {delete=[10064 (-1415336643212083200)]} 0 0
[junit4:junit4]   2> 6276 T241 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=0 
[junit4:junit4]   2> 6277 T230 C16 P52151 /update {wt=javabin&version=2} {delete=[10064 (-1415336643215228928)]} 0 4
[junit4:junit4]   2> 6278 T240 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=1 
[junit4:junit4]   2> 6279 T231 C16 P52151 /update {wt=javabin&version=2} {add=[68 (1415336643215228929)]} 0 6
[junit4:junit4]   2> 6282 T214 C17 P39071 /update {wt=javabin&version=2} {add=[10067 (1415336643222568960)]} 0 2
[junit4:junit4]   2> 6283 T215 C17 P39071 /update {wt=javabin&version=2} {add=[69 (1415336643223617536)]} 0 1
[junit4:junit4]   2> 6289 T240 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=1 
[junit4:junit4]   2> 6290 T241 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=1 
[junit4:junit4]   2> 6290 T231 C16 P52151 /update {wt=javabin&version=2} {add=[10067 (1415336643226763264)]} 0 6
[junit4:junit4]   2> 6290 T230 C16 P52151 /update {wt=javabin&version=2} {add=[69 (1415336643227811840)]} 0 5
[junit4:junit4]   2> 6293 T215 C17 P39071 /update {wt=javabin&version=2} {delete=[10065 (-1415336643235151872)]} 0 1
[junit4:junit4]   2> 6294 T214 C17 P39071 /update {wt=javabin&version=2} {add=[70 (1415336643235151873)]} 0 1
[junit4:junit4]   2> 6298 T241 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=1 
[junit4:junit4]   2> 6298 T230 C16 P52151 /update {wt=javabin&version=2} {delete=[10065 (-1415336643237249024)]} 0 3
[junit4:junit4]   2> 6300 T240 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=1 
[junit4:junit4]   2> 6301 T231 C16 P52151 /update {wt=javabin&version=2} {add=[70 (1415336643238297600)]} 0 5
[junit4:junit4]   2> 6302 T214 C17 P39071 /update {wt=javabin&version=2} {add=[10068 (1415336643243540480)]} 0 1
[junit4:junit4]   2> 6304 T215 C17 P39071 /update {wt=javabin&version=2} {add=[71 (1415336643245637632)]} 0 1
[junit4:junit4]   2> 6311 T240 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=1 
[junit4:junit4]   2> 6312 T230 C16 P52151 /update {wt=javabin&version=2} {add=[71 (1415336643249831936)]} 0 5
[junit4:junit4]   2> 6317 T240 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=1 
[junit4:junit4]   2> 6317 T231 C16 P52151 /update {wt=javabin&version=2} {add=[10068 (1415336643246686208)]} 0 13
[junit4:junit4]   2> 6322 T214 C17 P39071 /update {wt=javabin&version=2} {add=[10069 (1415336643263463424)]} 0 2
[junit4:junit4]   2> 6325 T215 C17 P39071 /update {wt=javabin&version=2} {add=[72 (1415336643258220544)]} 0 10
[junit4:junit4]   2> 6329 T240 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=1 
[junit4:junit4]   2> 6330 T231 C16 P52151 /update {wt=javabin&version=2} {add=[10069 (1415336643268706304)]} 0 6
[junit4:junit4]   2> 6333 T215 C17 P39071 /update {wt=javabin&version=2} {add=[10070 (1415336643277094912)]} 0 1
[junit4:junit4]   2> 6341 T241 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=2 
[junit4:junit4]   2> 6342 T231 C16 P52151 /update {wt=javabin&version=2} {add=[10070 (1415336643280240640)]} 0 6
[junit4:junit4]   2> 6346 T215 C17 P39071 /update {wt=javabin&version=2} {add=[10071 (1415336643289677824)]} 0 2
[junit4:junit4]   2> 6353 T240 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=16 
[junit4:junit4]   2> 6353 T241 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=1 
[junit4:junit4]   2> 6354 T230 C16 P52151 /update {wt=javabin&version=2} {add=[72 (1415336643270803456)]} 0 27
[junit4:junit4]   2> 6354 T231 C16 P52151 /update {wt=javabin&version=2} {add=[10071 (1415336643293872128)]} 0 6
[junit4:junit4]   2> 6358 T214 C17 P39071 /update {wt=javabin&version=2} {add=[10072 (1415336643302260736)]} 0 2
[junit4:junit4]   2> 6358 T215 C17 P39071 /update {wt=javabin&version=2} {add=[73 (1415336643302260737)]} 0 2
[junit4:junit4]   2> 6365 T241 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=1 
[junit4:junit4]   2> 6366 T240 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=2 
[junit4:junit4]   2> 6366 T231 C16 P52151 /update {wt=javabin&version=2} {add=[73 (1415336643306455040)]} 0 5
[junit4:junit4]   2> 6367 T230 C16 P52151 /update {wt=javabin&version=2} {add=[10072 (1415336643305406464)]} 0 7
[junit4:junit4]   2> 6369 T215 C17 P39071 /update {wt=javabin&version=2} {delete=[66 (-1415336643314843648)]} 0 0
[junit4:junit4]   2> 6370 T214 C17 P39071 /update {wt=javabin&version=2} {add=[10073 (1415336643314843649)]} 0 1
[junit4:junit4]   2> 6375 T240 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=0 
[junit4:junit4]   2> 6376 T230 C16 P52151 /update {wt=javabin&version=2} {delete=[66 (-1415336643319037952)]} 0 4
[junit4:junit4]   2> 6377 T241 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=2 
[junit4:junit4]   2> 6377 T231 C16 P52151 /update {wt=javabin&version=2} {add=[10073 (1415336643319037953)]} 0 5
[junit4:junit4]   2> 6380 T215 C17 P39071 /update {wt=javabin&version=2} {delete=[10066 (-1415336643326377985)]} 0 0
[junit4:junit4]   2> 6380 T214 C17 P39071 /update {wt=javabin&version=2} {add=[74 (1415336643326377984)]} 0 1
[junit4:junit4]   2> 6385 T241 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=0 
[junit4:junit4]   2> 6387 T240 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=1 
[junit4:junit4]   2> 6388 T231 C16 P52151 /update {wt=javabin&version=2} {delete=[10066 (-1415336643329523712)]} 0 5
[junit4:junit4]   2> 6388 T230 C16 P52151 /update {wt=javabin&version=2} {add=[74 (1415336643329523713)]} 0 5
[junit4:junit4]   2> 6391 T215 C17 P39071 /update {wt=javabin&version=2} {delete=[67 (-1415336643336863745)]} 0 1
[junit4:junit4]   2> 6391 T214 C17 P39071 /update {wt=javabin&version=2} {add=[10074 (1415336643336863744)]} 0 1
[junit4:junit4]   2> 6396 T240 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=0 
[junit4:junit4]   2> 6397 T230 C16 P52151 /update {wt=javabin&version=2} {delete=[67 (-1415336643341058048)]} 0 4
[junit4:junit4]   2> 6398 T241 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=2 
[junit4:junit4]   2> 6398 T231 C16 P52151 /update {wt=javabin&version=2} {add=[10074 (1415336643341058049)]} 0 4
[junit4:junit4]   2> 6401 T214 C17 P39071 /update {wt=javabin&version=2} {add=[75 (1415336643347349504)]} 0 1
[junit4:junit4]   2> 6401 T215 C17 P39071 /update {wt=javabin&version=2} {delete=[10067 (-1415336643348398080)]} 0 0
[junit4:junit4]   2> 6407 T241 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=1 
[junit4:junit4]   2> 6408 T240 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=2 
[junit4:junit4]   2> 6408 T230 C16 P52151 /update {wt=javabin&version=2} {delete=[10067 (-1415336643351543809)]} 0 4
[junit4:junit4]   2> 6408 T231 C16 P52151 /update {wt=javabin&version=2} {add=[75 (1415336643351543808)]} 0 5
[junit4:junit4]   2> 6411 T214 C17 P39071 /update {wt=javabin&version=2} {delete=[68 (-1415336643358883840)]} 0 1
[junit4:junit4]   2> 6416 T240 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=1 
[junit4:junit4]   2> 6416 T231 C16 P52151 /update {wt=javabin&version=2} {delete=[68 (-1415336643360980992)]} 0 3
[junit4:junit4]   2> 6421 T214 C17 P39071 /update {wt=javabin&version=2} {add=[76 (1415336643367272448)]} 0 2
[junit4:junit4]   2> 6427 T240 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=1 
[junit4:junit4]   2> 6428 T231 C16 P52151 /update {wt=javabin&version=2} {add=[76 (1415336643372515328)]} 0 5
[junit4:junit4]   2> 6431 T214 C17 P39071 /update {wt=javabin&version=2} {delete=[72 (-1415336643379855360)]} 0 1
[junit4:junit4]   2> 6436 T240 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=0 
[junit4:junit4]   2> 6437 T231 C16 P52151 /update {wt=javabin&version=2} {delete=[72 (-1415336643383001088)]} 0 4
[junit4:junit4]   2> 6440 T214 C17 P39071 /update {wt=javabin&version=2} {add=[77 (1415336643388243968)]} 0 1
[junit4:junit4]   2> 6454 T240 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=9 
[junit4:junit4]   2> 6455 T231 C16 P52151 /update {wt=javabin&version=2} {add=[77 (1415336643392438272)]} 0 13
[junit4:junit4]   2> 6458 T214 C17 P39071 /update {wt=javabin&version=2} {delete=[74 (-1415336643408166912)]} 0 1
[junit4:junit4]   2> 6472 T240 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=1 
[junit4:junit4]   2> 6473 T231 C16 P52151 /update {wt=javabin&version=2} {delete=[74 (-1415336643411312640)]} 0 13
[junit4:junit4]   2> 6476 T214 C17 P39071 /update {wt=javabin&version=2} {add=[78 (1415336643427041280)]} 0 1
[junit4:junit4]   2> 6484 T215 C17 P39071 /update {wt=javabin&version=2} {add=[10075 (1415336643358883841)]} 0 74
[junit4:junit4]   2> 6496 T240 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=2 
[junit4:junit4]   2> 6497 T230 C16 P52151 /update {wt=javabin&version=2} {add=[10075 (1415336643438575616)]} 0 10
[junit4:junit4]   2> 6500 T215 C17 P39071 /update {wt=javabin&version=2} {delete=[10068 (-1415336643452207104)]} 0 0
[junit4:junit4]   2> 6507 T240 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=1 
[junit4:junit4]   2> 6508 T230 C16 P52151 /update {wt=javabin&version=2} {delete=[10068 (-1415336643456401408)]} 0 4
[junit4:junit4]   2> 6512 T215 C17 P39071 /update {wt=javabin&version=2} {add=[10076 (1415336643463741440)]} 0 1
[junit4:junit4]   2> 6520 T240 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=1 
[junit4:junit4]   2> 6521 T230 C16 P52151 /update {wt=javabin&version=2} {add=[10076 (1415336643467935744)]} 0 6
[junit4:junit4]   2> 6524 T215 C17 P39071 /update {wt=javabin&version=2} {delete=[10072 (-1415336643477372928)]} 0 0
[junit4:junit4]   2> 6531 T240 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=1 
[junit4:junit4]   2> 6532 T230 C16 P52151 /update {wt=javabin&version=2} {delete=[10072 (-1415336643481567232)]} 0 4
[junit4:junit4]   2> 6536 T215 C17 P39071 /update {wt=javabin&version=2} {add=[10077 (1415336643488907264)]} 0 1
[junit4:junit4]   2> 6544 T240 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=1 
[junit4:junit4]   2> 6545 T230 C16 P52151 /update {wt=javabin&version=2} {add=[10077 (1415336643493101568)]} 0 6
[junit4:junit4]   2> 6549 T215 C17 P39071 /update {wt=javabin&version=2} {delete=[10074 (-1415336643502538752)]} 0 1
[junit4:junit4]   2> 6555 T240 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=0 
[junit4:junit4]   2> 6555 T230 C16 P52151 /update {wt=javabin&version=2} {delete=[10074 (-1415336643506733056)]} 0 4
[junit4:junit4]   2> 6560 T215 C17 P39071 /update {wt=javabin&version=2} {add=[10078 (1415336643514073088)]} 0 2
[junit4:junit4]   2> 6568 T240 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=1 
[junit4:junit4]   2> 6570 T230 C16 P52151 /update {wt=javabin&version=2} {add=[10078 (1415336643518267392)]} 0 7
[junit4:junit4]   2> 6571 T241 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=1 
[junit4:junit4]   2> 6572 T231 C16 P52151 /update {wt=javabin&version=2} {add=[78 (1415336643430187008)]} 0 93
[junit4:junit4]   2> 6574 T215 C17 P39071 /update {wt=javabin&version=2} {add=[10079 (1415336643528753152)]} 0 1
[junit4:junit4]   2> 6577 T214 C17 P39071 /update {wt=javabin&version=2} {add=[79 (1415336643531898880)]} 0 2
[junit4:junit4]   2> 6585 T241 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=2 
[junit4:junit4]   2> 6588 T231 C16 P52151 /update {wt=javabin&version=2} {add=[10079 (1415336643535044608)]} 0 10
[junit4:junit4]   2> 6590 T240 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=1 
[junit4:junit4]   2> 6591 T230 C16 P52151 /update {wt=javabin&version=2} {add=[79 (1415336643542384640)]} 0 5
[junit4:junit4]   2> 6593 T214 C17 P39071 /update {wt=javabin&version=2} {delete=[10075 (-1415336643549724672)]} 0 0
[junit4:junit4]   2> 6594 T215 C17 P39071 /update {wt=javabin&version=2} {delete=[75 (-1415336643550773248)]} 0 0
[junit4:junit4]   2> 6604 T240 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=0 
[junit4:junit4]   2> 6605 T241 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=0 
[junit4:junit4]   2> 6606 T230 C16 P52151 /update {wt=javabin&version=2} {delete=[75 (-1415336643559161856)]} 0 4
[junit4:junit4]   2> 6607 T231 C16 P52151 /update {wt=javabin&version=2} {delete=[10075 (-1415336643553918976)]} 0 10
[junit4:junit4]   2> 6609 T214 C17 P39071 /update {wt=javabin&version=2} {add=[80 (1415336643566501888)]} 0 0
[junit4:junit4]   2> 6622 T215 C17 P39071 /update {wt=javabin&version=2} {add=[10080 (1415336643567550464)]} 0 12
[junit4:junit4]   2> 6623 T241 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=1 
[junit4:junit4]   2> 6624 T231 C16 P52151 /update {wt=javabin&version=2} {add=[80 (1415336643576987648)]} 0 6
[junit4:junit4]   2> 6628 T215 C17 P39071 /update {wt=javabin&version=2} {delete=[76 (-1415336643585376256)]} 0 1
[junit4:junit4]   2> 6629 T241 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=1 
[junit4:junit4]   2> 6630 T230 C16 P52151 /update {wt=javabin&version=2} {add=[10080 (1415336643583279104)]} 0 5
[junit4:junit4]   2> 6633 T241 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=0 
[junit4:junit4]   2> 6633 T215 C17 P39071 /update {wt=javabin&version=2} {delete=[10076 (-1415336643591667712)]} 0 0
[junit4:junit4]   2> 6634 T231 C16 P52151 /update {wt=javabin&version=2} {delete=[76 (-1415336643589570560)]} 0 4
[junit4:junit4]   2> 6639 T241 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=0 
[junit4:junit4]   2> 6640 T215 C17 P39071 /update {wt=javabin&version=2} {add=[81 (1415336643596910592)]} 0 3
[junit4:junit4]   2> 6641 T230 C16 P52151 /update {wt=javabin&version=2} {delete=[10076 (-1415336643595862016)]} 0 5
[junit4:junit4]   2> 6645 T215 C17 P39071 /update {wt=javabin&version=2} {add=[10081 (1415336643603202048)]} 0 2
[junit4:junit4]   2> 6655 T240 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=1 
[junit4:junit4]   2> 6656 T230 C16 P52151 /update {wt=javabin&version=2} {add=[10081 (1415336643607396352)]} 0 8
[junit4:junit4]   2> 6658 T241 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=12 
[junit4:junit4]   2> 6659 T231 C16 P52151 /update {wt=javabin&version=2} {add=[81 (1415336643602153472)]} 0 16
[junit4:junit4]   2> 6660 T215 C17 P39071 /update {wt=javabin&version=2} {delete=[10080 (-1415336643618930688)]} 0 1
[junit4:junit4]   2> 6663 T214 C17 P39071 /update {wt=javabin&version=2} {delete=[80 (-1415336643623124992)]} 0 1
[junit4:junit4]   2> 6670 T240 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=1 
[junit4:junit4]   2> 6671 T231 C16 P52151 /update {wt=javabin&version=2} {delete=[10080 (-1415336643627319296)]} 0 4
[junit4:junit4]   2> 6673 T241 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=1 
[junit4:junit4]   2> 6674 T230 C16 P52151 /update {wt=javabin&version=2} {delete=[80 (-1415336643626270720)]} 0 8
[junit4:junit4]   2> 6677 T214 C17 P39071 /update {wt=javabin&version=2} {add=[10082 (1415336643635707904)]} 0 3
[junit4:junit4]   2> 6678 T215 C17 P39071 /update {wt=javabin&version=2} {add=[82 (1415336643637805056)]} 0 1
[junit4:junit4]   2> 6685 T241 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=1 
[junit4:junit4]   2> 6686 T231 C16 P52151 /update {wt=javabin&version=2} {add=[82 (1415336643641999360)]} 0 5
[junit4:junit4]   2> 6689 T215 C17 P39071 /update {wt=javabin&version=2} {delete=[82 (-1415336643649339392)]} 0 1
[junit4:junit4]   2> 6694 T241 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=0 
[junit4:junit4]   2> 6695 T231 C16 P52151 /update {wt=javabin&version=2} {delete=[82 (-1415336643652485120)]} 0 4
[junit4:junit4]   2> 6696 T240 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=1 
[junit4:junit4]   2> 6697 T230 C16 P52151 /update {wt=javabin&version=2} {add=[10082 (1415336643640950784)]} 0 17
[junit4:junit4]   2> 6698 T215 C17 P39071 /update {wt=javabin&version=2} {add=[83 (1415336643659825152)]} 0 1
[junit4:junit4]   2> 6700 T214 C17 P39071 /update {wt=javabin&version=2} {delete=[10082 (-1415336643660873728)]} 0 1
[junit4:junit4]   2> 6705 T240 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=1 
[junit4:junit4]   2> 6705 T241 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=1 
[junit4:junit4]   2> 6706 T231 C16 P52151 /update {wt=javabin&version=2} {delete=[10082 (-1415336643664019456)]} 0 4
[junit4:junit4]   2> 6706 T230 C16 P52151 /update {wt=javabin&version=2} {add=[83 (1415336643662970880)]} 0 5
[junit4:junit4]   2> 6710 T215 C17 P39071 /update {wt=javabin&version=2} {add=[10083 (1415336643671359489)]} 0 2
[junit4:junit4]   2> 6711 T214 C17 P39071 /update {wt=javabin&version=2} {add=[84 (1415336643671359488)]} 0 3
[junit4:junit4]   2> 6717 T241 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=1 
[junit4:junit4]   2> 6718 T240 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=2 
[junit4:junit4]   2> 6718 T231 C16 P52151 /update {wt=javabin&version=2} {add=[10083 (1415336643675553792)]} 0 5
[junit4:junit4]   2> 6718 T230 C16 P52151 /update {wt=javabin&version=2} {add=[84 (1415336643675553793)]} 0 5
[junit4:junit4]   2> 6722 T215 C17 P39071 /update {wt=javabin&version=2} {add=[85 (1415336643683942400)]} 0 1
[junit4:junit4]   2> 6722 T214 C17 P39071 /update {wt=javabin&version=2} {add=[10084 (1415336643683942401)]} 0 1
[junit4:junit4]   2> 6729 T240 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=1 
[junit4:junit4]   2> 6729 T241 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=2 
[junit4:junit4]   2> 6729 T231 C16 P52151 /update {wt=javabin&version=2} {add=[10084 (1415336643688136705)]} 0 4
[junit4:junit4]   2> 6730 T230 C16 P52151 /update {wt=javabin&version=2} {add=[85 (1415336643688136704)]} 0 6
[junit4:junit4]   2> 6735 T214 C17 P39071 /update {wt=javabin&version=2} {add=[86 (1415336643695476737)]} 0 3
[junit4:junit4]   2> 6741 T215 C17 P39071 /update {wt=javabin&version=2} {add=[10085 (1415336643695476736)]} 0 9
[junit4:junit4]   2> 6742 T240 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=1 
[junit4:junit4]   2> 6743 T231 C16 P52151 /update {wt=javabin&version=2} {add=[86 (1415336643701768192)]} 0 5
[junit4:junit4]   2> 6745 T215 C17 P39071 /update {wt=javabin&version=2} {delete=[83 (-1415336643709108224)]} 0 0
[junit4:junit4]   2> 6752 T241 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=0 
[junit4:junit4]   2> 6753 T231 C16 P52151 /update {wt=javabin&version=2} {delete=[83 (-1415336643712253952)]} 0 5
[junit4:junit4]   2> 6757 T240 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=10 
[junit4:junit4]   2> 6758 T215 C17 P39071 /update {wt=javabin&version=2} {add=[87 (1415336643721691136)]} 0 2
[junit4:junit4]   2> 6758 T230 C16 P52151 /update {wt=javabin&version=2} {add=[10085 (1415336643708059648)]} 0 14
[junit4:junit4]   2> 6762 T215 C17 P39071 /update {wt=javabin&version=2} {add=[10086 (1415336643725885440)]} 0 2
[junit4:junit4]   2> 6766 T240 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=3 
[junit4:junit4]   2> 6766 T230 C16 P52151 /update {wt=javabin&version=2} {add=[87 (1415336643725885440)]} 0 6
[junit4:junit4]   2> 6769 T241 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=1 
[junit4:junit4]   2> 6770 T231 C16 P52151 /update {wt=javabin&version=2} {add=[10086 (1415336643730079744)]} 0 6
[junit4:junit4]   2> 6770 T215 C17 P39071 /update {wt=javabin&version=2} {add=[88 (1415336643734274048)]} 0 1
[junit4:junit4]   2> 6772 T214 C17 P39071 /update {wt=javabin&version=2} {delete=[10083 (-1415336643737419776)]} 0 0
[junit4:junit4]   2> 6776 T241 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=1 
[junit4:junit4]   2> 6777 T231 C16 P52151 /update {wt=javabin&version=2} {add=[88 (1415336643738468352)]} 0 5
[junit4:junit4]   2> 6778 T240 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=0 
[junit4:junit4]   2> 6779 T230 C16 P52151 /update {wt=javabin&version=2} {delete=[10083 (-1415336643740565504)]} 0 4
[junit4:junit4]   2> 6780 T214 C17 P39071 /update {wt=javabin&version=2} {add=[89 (1415336643744759808)]} 0 1
[junit4:junit4]   2> 6783 T215 C17 P39071 /update {wt=javabin&version=2} {add=[10087 (1415336643747905536)]} 0 1
[junit4:junit4]   2> 6787 T240 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=1 
[junit4:junit4]   2> 6788 T230 C16 P52151 /update {wt=javabin&version=2} {add=[89 (1415336643748954112)]} 0 5
[junit4:junit4]   2> 6791 T215 C17 P39071 /update {wt=javabin&version=2} {delete=[85 (-1415336643757342720)]} 0 0
[junit4:junit4]   2> 6797 T240 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=0 
[junit4:junit4]   2> 6798 T241 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=1 
[junit4:junit4]   2> 6798 T230 C16 P52151 /update {wt=javabin&version=2} {delete=[85 (-1415336643761537024)]} 0 4
[junit4:junit4]   2> 6798 T231 C16 P52151 /update {wt=javabin&version=2} {add=[10087 (1415336643752099840)]} 0 12
[junit4:junit4]   2> 6802 T215 C17 P39071 /update {wt=javabin&version=2} {add=[90 (1415336643767828480)]} 0 1
[junit4:junit4]   2> 6802 T214 C17 P39071 /update {wt=javabin&version=2} {add=[10088 (1415336643767828481)]} 0 1
[junit4:junit4]   2> 6809 T241 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=1 
[junit4:junit4]   2> 6810 T240 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=2 
[junit4:junit4]   2> 6810 T231 C16 P52151 /update {wt=javabin&version=2} {add=[90 (1415336643772022784)]} 0 5
[junit4:junit4]   2> 6811 T230 C16 P52151 /update {wt=javabin&version=2} {add=[10088 (1415336643772022785)]} 0 6
[junit4:junit4]   2> 6813 T214 C17 P39071 /update {wt=javabin&version=2} {delete=[86 (-1415336643780411392)]} 0 0
[junit4:junit4]   2> 6814 T215 C17 P39071 /update {wt=javabin&version=2} {add=[10089 (1415336643780411393)]} 0 1
[junit4:junit4]   2> 6818 T240 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=0 
[junit4:junit4]   2> 6819 T230 C16 P52151 /update {wt=javabin&version=2} {delete=[86 (-1415336643783557120)]} 0 3
[junit4:junit4]   2> 6821 T241 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=1 
[junit4:junit4]   2> 6822 T231 C16 P52151 /update {wt=javabin&version=2} {add=[10089 (1415336643784605696)]} 0 5
[junit4:junit4]   2> 6824 T214 C17 P39071 /update {wt=javabin&version=2} {delete=[10085 (-1415336643791945728)]} 0 0
[junit4:junit4]   2> 6831 T241 C15 P51813 REQ /update {distrib.from=http://127.0.0.1:52151/solr/collection1/&update.distrib=FROMLEADER&wt=javabin&version=2} status=0 QTime=1 
[junit4:junit4]   2> 6832 T231 C16 P52151 /update {wt=javabin&version=2} {delete=[10085 (-1415336643796140032)]} 0 5
[junit4:junit4]   2> 6834 T215 C17 P39071 /update {wt=javabin&version=2} {ad

[...truncated too long message...]

ption: Connection refused
[junit4:junit4]   2> 	at sun.nio.ch.SocketChannelImpl.checkConnect(Native Method)
[junit4:junit4]   2> 	at sun.nio.ch.SocketChannelImpl.finishConnect(SocketChannelImpl.java:692)
[junit4:junit4]   2> 	at org.apache.zookeeper.ClientCnxn$SendThread.run(ClientCnxn.java:1143)
[junit4:junit4]   2> 
[junit4:junit4]   2> 24872 T235 oaz.ClientCnxn$SendThread.startConnect Opening socket connection to server localhost.localdomain/127.0.0.1:48755
[junit4:junit4]   2> 24973 T236 oaz.ClientCnxn$EventThread.run EventThread shut down
[junit4:junit4]   2> 24973 T202 oaz.ZooKeeper.close Session: 0x13a4492c1f40003 closed
[junit4:junit4]   2> 24974 T202 oejsh.ContextHandler.doStop stopped o.e.j.s.ServletContextHandler{/solr,null}
[junit4:junit4]   2> 25027 T202 oasc.ChaosMonkey.monkeyLog monkey: stop shard! 51813
[junit4:junit4]   2> 25027 T202 oasc.CoreContainer.shutdown Shutting down CoreContainer instance=267474212
[junit4:junit4]   2> 26144 T342 oaz.ClientCnxn$SendThread.startConnect Opening socket connection to server localhost.localdomain/127.0.0.1:48755
[junit4:junit4]   2> 26246 T343 oaz.ClientCnxn$EventThread.run EventThread shut down
[junit4:junit4]   2> 26246 T202 oaz.ZooKeeper.close Session: 0x13a4492c1f40007 closed
[junit4:junit4]   2> 26247 T202 oejsh.ContextHandler.doStop stopped o.e.j.s.ServletContextHandler{/solr,null}
[junit4:junit4]   2> 26341 T202 oas.SolrTestCaseJ4.tearDown ###Ending testDistribSearch
[junit4:junit4]   2> NOTE: reproduce with: ant test  -Dtestcase=RecoveryZkTest -Dtests.method=testDistribSearch -Dtests.seed=C7FC3171220FD5FC -Dtests.multiplier=3 -Dtests.slow=true -Dtests.locale=sv_SE -Dtests.timezone=America/Santo_Domingo -Dtests.file.encoding=UTF-8
[junit4:junit4] ERROR   26.4s J1 | RecoveryZkTest.testDistribSearch <<<
[junit4:junit4]    > Throwable #1: org.apache.solr.common.SolrException: Server at http://127.0.0.1:51813/solr/collection1 returned non ok status:404, message:Can not find: /solr/collection1/select
[junit4:junit4]    > 	at __randomizedtesting.SeedInfo.seed([C7FC3171220FD5FC:461ABF695550B5C0]:0)
[junit4:junit4]    > 	at org.apache.solr.client.solrj.impl.HttpSolrServer.request(HttpSolrServer.java:372)
[junit4:junit4]    > 	at org.apache.solr.client.solrj.impl.HttpSolrServer.request(HttpSolrServer.java:181)
[junit4:junit4]    > 	at org.apache.solr.client.solrj.request.QueryRequest.process(QueryRequest.java:90)
[junit4:junit4]    > 	at org.apache.solr.client.solrj.SolrServer.query(SolrServer.java:301)
[junit4:junit4]    > 	at org.apache.solr.cloud.RecoveryZkTest.doTest(RecoveryZkTest.java:92)
[junit4:junit4]    > 	at org.apache.solr.BaseDistributedSearchTestCase.testDistribSearch(BaseDistributedSearchTestCase.java:695)
[junit4:junit4]    > 	at sun.reflect.NativeMethodAccessorImpl.invoke0(Native Method)
[junit4:junit4]    > 	at sun.reflect.NativeMethodAccessorImpl.invoke(NativeMethodAccessorImpl.java:57)
[junit4:junit4]    > 	at sun.reflect.DelegatingMethodAccessorImpl.invoke(DelegatingMethodAccessorImpl.java:43)
[junit4:junit4]    > 	at java.lang.reflect.Method.invoke(Method.java:601)
[junit4:junit4]    > 	at com.carrotsearch.randomizedtesting.RandomizedRunner.invoke(RandomizedRunner.java:1559)
[junit4:junit4]    > 	at com.carrotsearch.randomizedtesting.RandomizedRunner.access$600(RandomizedRunner.java:79)
[junit4:junit4]    > 	at com.carrotsearch.randomizedtesting.RandomizedRunner$6.evaluate(RandomizedRunner.java:737)
[junit4:junit4]    > 	at com.carrotsearch.randomizedtesting.RandomizedRunner$7.evaluate(RandomizedRunner.java:773)
[junit4:junit4]    > 	at com.carrotsearch.randomizedtesting.RandomizedRunner$8.evaluate(RandomizedRunner.java:787)
[junit4:junit4]    > 	at com.carrotsearch.randomizedtesting.rules.SystemPropertiesRestoreRule$1.evaluate(SystemPropertiesRestoreRule.java:53)
[junit4:junit4]    > 	at org.apache.lucene.util.TestRuleSetupTeardownChained$1.evaluate(TestRuleSetupTeardownChained.java:50)
[junit4:junit4]    > 	at org.apache.lucene.util.TestRuleFieldCacheSanity$1.evaluate(TestRuleFieldCacheSanity.java:51)
[junit4:junit4]    > 	at org.apache.lucene.util.AbstractBeforeAfterRule$1.evaluate(AbstractBeforeAfterRule.java:45)
[junit4:junit4]    > 	at com.carrotsearch.randomizedtesting.rules.SystemPropertiesInvariantRule$1.evaluate(SystemPropertiesInvariantRule.java:55)
[junit4:junit4]    > 	at org.apache.lucene.util.TestRuleThreadAndTestName$1.evaluate(TestRuleThreadAndTestName.java:48)
[junit4:junit4]    > 	at org.apache.lucene.util.TestRuleIgnoreAfterMaxFailures$1.evaluate(TestRuleIgnoreAfterMaxFailures.java:70)
[junit4:junit4]    > 	at org.apache.lucene.util.TestRuleMarkFailure$1.evaluate(TestRuleMarkFailure.java:48)
[junit4:junit4]    > 	at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
[junit4:junit4]    > 	at com.carrotsearch.randomizedtesting.ThreadLeakControl$StatementRunner.run(ThreadLeakControl.java:358)
[junit4:junit4]    > 	at com.carrotsearch.randomizedtesting.ThreadLeakControl.forkTimeoutingTask(ThreadLeakControl.java:782)
[junit4:junit4]    > 	at com.carrotsearch.randomizedtesting.ThreadLeakControl$3.evaluate(ThreadLeakControl.java:442)
[junit4:junit4]    > 	at com.carrotsearch.randomizedtesting.RandomizedRunner.runSingleTest(RandomizedRunner.java:746)
[junit4:junit4]    > 	at com.carrotsearch.randomizedtesting.RandomizedRunner$3.evaluate(RandomizedRunner.java:648)
[junit4:junit4]    > 	at com.carrotsearch.randomizedtesting.RandomizedRunner$4.evaluate(RandomizedRunner.java:682)
[junit4:junit4]    > 	at com.carrotsearch.randomizedtesting.RandomizedRunner$5.evaluate(RandomizedRunner.java:693)
[junit4:junit4]    > 	at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
[junit4:junit4]    > 	at com.carrotsearch.randomizedtesting.rules.SystemPropertiesRestoreRule$1.evaluate(SystemPropertiesRestoreRule.java:53)
[junit4:junit4]    > 	at org.apache.lucene.util.AbstractBeforeAfterRule$1.evaluate(AbstractBeforeAfterRule.java:45)
[junit4:junit4]    > 	at org.apache.lucene.util.TestRuleStoreClassName$1.evaluate(TestRuleStoreClassName.java:42)
[junit4:junit4]    > 	at com.carrotsearch.randomizedtesting.rules.SystemPropertiesInvariantRule$1.evaluate(SystemPropertiesInvariantRule.java:55)
[junit4:junit4]    > 	at com.carrotsearch.randomizedtesting.rules.NoShadowingOrOverridesOnMethodsRule$1.evaluate(NoShadowingOrOverridesOnMethodsRule.java:39)
[junit4:junit4]    > 	at com.carrotsearch.randomizedtesting.rules.NoShadowingOrOverridesOnMethodsRule$1.evaluate(NoShadowingOrOverridesOnMethodsRule.java:39)
[junit4:junit4]    > 	at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
[junit4:junit4]    > 	at org.apache.lucene.util.TestRuleAssertionsRequired$1.evaluate(TestRuleAssertionsRequired.java:43)
[junit4:junit4]    > 	at org.apache.lucene.util.TestRuleMarkFailure$1.evaluate(TestRuleMarkFailure.java:48)
[junit4:junit4]    > 	at org.apache.lucene.util.TestRuleIgnoreAfterMaxFailures$1.evaluate(TestRuleIgnoreAfterMaxFailures.java:70)
[junit4:junit4]    > 	at org.apache.lucene.util.TestRuleIgnoreTestSuites$1.evaluate(TestRuleIgnoreTestSuites.java:55)
[junit4:junit4]    > 	at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
[junit4:junit4]    > 	at com.carrotsearch.randomizedtesting.ThreadLeakControl$StatementRunner.run(ThreadLeakControl.java:358)
[junit4:junit4]    > 	at java.lang.Thread.run(Thread.java:722)
[junit4:junit4]   2> 26356 T202 oas.SolrTestCaseJ4.deleteCore ###deleteCore
[junit4:junit4]   2> NOTE: test params are: codec=Lucene40: {range_facet_l=PostingsFormat(name=Memory doPackFST= true), text=Pulsing40(freqCutoff=12 minBlockSize=50 maxBlockSize=131), _version_=PostingsFormat(name=Memory doPackFST= true), rnd_b=MockFixedIntBlock(blockSize=1078), intDefault=PostingsFormat(name=Memory doPackFST= true), timestamp=PostingsFormat(name=Memory doPackFST= true), id=MockFixedIntBlock(blockSize=1078), a_t=PostingsFormat(name=Memory doPackFST= true), range_facet_sl=Pulsing40(freqCutoff=12 minBlockSize=50 maxBlockSize=131), range_facet_si=PostingsFormat(name=Direct), other_tl1=PostingsFormat(name=Memory doPackFST= true), multiDefault=PostingsFormat(name=Direct), a_si=PostingsFormat(name=Direct)}, sim=RandomSimilarityProvider(queryNorm=false,coord=crazy): {}, locale=sv_SE, timezone=America/Santo_Domingo
[junit4:junit4]   2> NOTE: Linux 3.2.0-31-generic amd64/Oracle Corporation 1.7.0_07 (64-bit)/cpus=8,threads=1,free=124102608,total=330301440
[junit4:junit4]   2> NOTE: All tests run in this JVM: [TestFunctionQuery, UUIDFieldTest, MultiTermTest, StatelessScriptUpdateProcessorFactoryTest, ScriptEngineTest, IndexSchemaRuntimeFieldTest, TestRealTimeGet, PolyFieldTest, TestCSVLoader, TestCodecSupport, RequiredFieldsTest, ConvertedLegacyTest, SolrInfoMBeanTest, EchoParamsTest, DebugComponentTest, TestUpdate, DistributedQueryElevationComponentTest, RecoveryZkTest]
[junit4:junit4] Completed on J1 in 26.38s, 1 test, 1 error <<< FAILURES!

[...truncated 649 lines...]
BUILD FAILED
/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/build.xml:38: The following error occurred while executing this line:
/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build.xml:180: The following error occurred while executing this line:
/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/lucene/module-build.xml:61: The following error occurred while executing this line:
/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/lucene/common-build.xml:1143: The following error occurred while executing this line:
/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/lucene/common-build.xml:816: There were test failures: 230 suites, 956 tests, 1 error, 7 ignored (2 assumptions)

Total time: 22 minutes 38 seconds
Build step 'Invoke Ant' marked build as failure
Archiving artifacts
Recording test results
Description set: Java: 64bit/jdk1.7.0_07 -XX:+UseG1GC
Email was triggered for: Failure
Sending email for trigger: Failure



Mime
View raw message