Build: https://jenkins.thetaphi.de/job/Lucene-Solr-master-Linux/18767/
Java: 32bit/jdk-9-ea+147 -server -XX:+UseSerialGC

1 tests failed.
FAILED:  junit.framework.TestSuite.org.apache.solr.search.stats.TestDistribIDF

Error Message:
1 thread leaked from SUITE scope at 
org.apache.solr.search.stats.TestDistribIDF:     1) Thread[id=4306, 
name=OverseerHdfsCoreFailoverThread-97276414634819589-127.0.0.1:42748_solr-n_0000000001,
 state=TIMED_WAITING, group=Overseer Hdfs SolrCore Failover Thread.]         at 
java.base/java.lang.Thread.sleep(Native Method)         at 
org.apache.solr.cloud.OverseerAutoReplicaFailoverThread.run(OverseerAutoReplicaFailoverThread.java:139)
         at java.base/java.lang.Thread.run(Thread.java:844)

Stack Trace:
com.carrotsearch.randomizedtesting.ThreadLeakError: 1 thread leaked from SUITE 
scope at org.apache.solr.search.stats.TestDistribIDF: 
   1) Thread[id=4306, 
name=OverseerHdfsCoreFailoverThread-97276414634819589-127.0.0.1:42748_solr-n_0000000001,
 state=TIMED_WAITING, group=Overseer Hdfs SolrCore Failover Thread.]
        at java.base/java.lang.Thread.sleep(Native Method)
        at 
org.apache.solr.cloud.OverseerAutoReplicaFailoverThread.run(OverseerAutoReplicaFailoverThread.java:139)
        at java.base/java.lang.Thread.run(Thread.java:844)
        at __randomizedtesting.SeedInfo.seed([F16DCBA044EEBD8B]:0)




Build Log:
[...truncated 11552 lines...]
   [junit4] Suite: org.apache.solr.search.stats.TestDistribIDF
   [junit4]   2> Creating dataDir: 
/home/jenkins/workspace/Lucene-Solr-master-Linux/solr/build/solr-core/test/J2/temp/solr.search.stats.TestDistribIDF_F16DCBA044EEBD8B-001/init-core-data-001
   [junit4]   2> 427204 INFO  
(SUITE-TestDistribIDF-seed#[F16DCBA044EEBD8B]-worker) [    ] 
o.a.s.SolrTestCaseJ4 Randomized ssl (false) and clientAuth (false) via: 
@org.apache.solr.util.RandomizeSSL(reason="", ssl=0.0/0.0, value=0.0/0.0, 
clientAuth=0.0/0.0)
   [junit4]   2> 427205 INFO  
(TEST-TestDistribIDF.testSimpleQuery-seed#[F16DCBA044EEBD8B]) [    ] 
o.a.s.SolrTestCaseJ4 ###Starting testSimpleQuery
   [junit4]   2> 427206 INFO  
(TEST-TestDistribIDF.testSimpleQuery-seed#[F16DCBA044EEBD8B]) [    ] 
o.a.s.c.MiniSolrCloudCluster Starting cluster of 3 servers in 
/home/jenkins/workspace/Lucene-Solr-master-Linux/solr/build/solr-core/test/J2/temp/solr.search.stats.TestDistribIDF_F16DCBA044EEBD8B-001/tempDir-001
   [junit4]   2> 427206 INFO  
(TEST-TestDistribIDF.testSimpleQuery-seed#[F16DCBA044EEBD8B]) [    ] 
o.a.s.c.ZkTestServer STARTING ZK TEST SERVER
   [junit4]   2> 427206 INFO  (Thread-995) [    ] o.a.s.c.ZkTestServer client 
port:0.0.0.0/0.0.0.0:0
   [junit4]   2> 427206 INFO  (Thread-995) [    ] o.a.s.c.ZkTestServer Starting 
server
   [junit4]   2> 427306 INFO  
(TEST-TestDistribIDF.testSimpleQuery-seed#[F16DCBA044EEBD8B]) [    ] 
o.a.s.c.ZkTestServer start zk server on port:38067
   [junit4]   2> 427312 INFO  (jetty-launcher-713-thread-1) [    ] 
o.e.j.s.Server jetty-9.3.14.v20161028
   [junit4]   2> 427312 INFO  (jetty-launcher-713-thread-2) [    ] 
o.e.j.s.Server jetty-9.3.14.v20161028
   [junit4]   2> 427312 INFO  (jetty-launcher-713-thread-3) [    ] 
o.e.j.s.Server jetty-9.3.14.v20161028
   [junit4]   2> 427313 INFO  (jetty-launcher-713-thread-1) [    ] 
o.e.j.s.h.ContextHandler Started 
o.e.j.s.ServletContextHandler@1e12bd8{/solr,null,AVAILABLE}
   [junit4]   2> 427313 INFO  (jetty-launcher-713-thread-2) [    ] 
o.e.j.s.h.ContextHandler Started 
o.e.j.s.ServletContextHandler@c54f4{/solr,null,AVAILABLE}
   [junit4]   2> 427313 INFO  (jetty-launcher-713-thread-3) [    ] 
o.e.j.s.h.ContextHandler Started 
o.e.j.s.ServletContextHandler@3d69b9{/solr,null,AVAILABLE}
   [junit4]   2> 427315 INFO  (jetty-launcher-713-thread-1) [    ] 
o.e.j.s.AbstractConnector Started 
ServerConnector@146661b{HTTP/1.1,[http/1.1]}{127.0.0.1:37090}
   [junit4]   2> 427315 INFO  (jetty-launcher-713-thread-3) [    ] 
o.e.j.s.AbstractConnector Started 
ServerConnector@efa95d{HTTP/1.1,[http/1.1]}{127.0.0.1:34974}
   [junit4]   2> 427315 INFO  (jetty-launcher-713-thread-1) [    ] 
o.e.j.s.Server Started @428948ms
   [junit4]   2> 427315 INFO  (jetty-launcher-713-thread-3) [    ] 
o.e.j.s.Server Started @428948ms
   [junit4]   2> 427315 INFO  (jetty-launcher-713-thread-2) [    ] 
o.e.j.s.AbstractConnector Started 
ServerConnector@e3eb2{HTTP/1.1,[http/1.1]}{127.0.0.1:33485}
   [junit4]   2> 427316 INFO  (jetty-launcher-713-thread-2) [    ] 
o.e.j.s.Server Started @428948ms
   [junit4]   2> 427316 INFO  (jetty-launcher-713-thread-1) [    ] 
o.a.s.c.s.e.JettySolrRunner Jetty properties: {hostContext=/solr, 
hostPort=37090}
   [junit4]   2> 427316 INFO  (jetty-launcher-713-thread-2) [    ] 
o.a.s.c.s.e.JettySolrRunner Jetty properties: {hostContext=/solr, 
hostPort=33485}
   [junit4]   2> 427316 INFO  (jetty-launcher-713-thread-3) [    ] 
o.a.s.c.s.e.JettySolrRunner Jetty properties: {hostContext=/solr, 
hostPort=34974}
   [junit4]   2> 427316 ERROR (jetty-launcher-713-thread-1) [    ] 
o.a.s.s.StartupLoggingUtils Missing Java Option solr.log.dir. Logging may be 
missing or incomplete.
   [junit4]   2> 427316 ERROR (jetty-launcher-713-thread-3) [    ] 
o.a.s.s.StartupLoggingUtils Missing Java Option solr.log.dir. Logging may be 
missing or incomplete.
   [junit4]   2> 427316 INFO  (jetty-launcher-713-thread-1) [    ] 
o.a.s.s.SolrDispatchFilter  ___      _       Welcome to Apache Solr? version 
7.0.0
   [junit4]   2> 427316 INFO  (jetty-launcher-713-thread-3) [    ] 
o.a.s.s.SolrDispatchFilter  ___      _       Welcome to Apache Solr? version 
7.0.0
   [junit4]   2> 427316 INFO  (jetty-launcher-713-thread-1) [    ] 
o.a.s.s.SolrDispatchFilter / __| ___| |_ _   Starting in cloud mode on port null
   [junit4]   2> 427316 INFO  (jetty-launcher-713-thread-3) [    ] 
o.a.s.s.SolrDispatchFilter / __| ___| |_ _   Starting in cloud mode on port null
   [junit4]   2> 427316 INFO  (jetty-launcher-713-thread-1) [    ] 
o.a.s.s.SolrDispatchFilter \__ \/ _ \ | '_|  Install dir: null
   [junit4]   2> 427316 ERROR (jetty-launcher-713-thread-2) [    ] 
o.a.s.s.StartupLoggingUtils Missing Java Option solr.log.dir. Logging may be 
missing or incomplete.
   [junit4]   2> 427316 INFO  (jetty-launcher-713-thread-1) [    ] 
o.a.s.s.SolrDispatchFilter |___/\___/_|_|    Start time: 
2017-01-13T15:11:22.283652Z
   [junit4]   2> 427316 INFO  (jetty-launcher-713-thread-2) [    ] 
o.a.s.s.SolrDispatchFilter  ___      _       Welcome to Apache Solr? version 
7.0.0
   [junit4]   2> 427316 INFO  (jetty-launcher-713-thread-3) [    ] 
o.a.s.s.SolrDispatchFilter \__ \/ _ \ | '_|  Install dir: null
   [junit4]   2> 427317 INFO  (jetty-launcher-713-thread-2) [    ] 
o.a.s.s.SolrDispatchFilter / __| ___| |_ _   Starting in cloud mode on port null
   [junit4]   2> 427317 INFO  (jetty-launcher-713-thread-3) [    ] 
o.a.s.s.SolrDispatchFilter |___/\___/_|_|    Start time: 
2017-01-13T15:11:22.284388Z
   [junit4]   2> 427317 INFO  (jetty-launcher-713-thread-2) [    ] 
o.a.s.s.SolrDispatchFilter \__ \/ _ \ | '_|  Install dir: null
   [junit4]   2> 427317 INFO  (jetty-launcher-713-thread-2) [    ] 
o.a.s.s.SolrDispatchFilter |___/\___/_|_|    Start time: 
2017-01-13T15:11:22.284512Z
   [junit4]   2> 427319 INFO  (jetty-launcher-713-thread-3) [    ] 
o.a.s.s.SolrDispatchFilter solr.xml found in ZooKeeper. Loading...
   [junit4]   2> 427319 INFO  (jetty-launcher-713-thread-2) [    ] 
o.a.s.s.SolrDispatchFilter solr.xml found in ZooKeeper. Loading...
   [junit4]   2> 427319 INFO  (jetty-launcher-713-thread-1) [    ] 
o.a.s.s.SolrDispatchFilter solr.xml found in ZooKeeper. Loading...
   [junit4]   2> 427337 INFO  (jetty-launcher-713-thread-3) [    ] 
o.a.s.c.ZkContainer Zookeeper client=127.0.0.1:38067/solr
   [junit4]   2> 427338 INFO  (jetty-launcher-713-thread-2) [    ] 
o.a.s.c.ZkContainer Zookeeper client=127.0.0.1:38067/solr
   [junit4]   2> 427339 INFO  (jetty-launcher-713-thread-1) [    ] 
o.a.s.c.ZkContainer Zookeeper client=127.0.0.1:38067/solr
   [junit4]   2> 427340 WARN  (NIOServerCxn.Factory:0.0.0.0/0.0.0.0:0) [    ] 
o.a.z.s.NIOServerCnxn caught end of stream exception
   [junit4]   2> EndOfStreamException: Unable to read additional data from 
client sessionid 0x1599862163f0005, likely client has closed socket
   [junit4]   2>        at 
org.apache.zookeeper.server.NIOServerCnxn.doIO(NIOServerCnxn.java:228)
   [junit4]   2>        at 
org.apache.zookeeper.server.NIOServerCnxnFactory.run(NIOServerCnxnFactory.java:208)
   [junit4]   2>        at java.base/java.lang.Thread.run(Thread.java:844)
   [junit4]   2> 427342 WARN  (NIOServerCxn.Factory:0.0.0.0/0.0.0.0:0) [    ] 
o.a.z.s.NIOServerCnxn caught end of stream exception
   [junit4]   2> EndOfStreamException: Unable to read additional data from 
client sessionid 0x1599862163f0006, likely client has closed socket
   [junit4]   2>        at 
org.apache.zookeeper.server.NIOServerCnxn.doIO(NIOServerCnxn.java:228)
   [junit4]   2>        at 
org.apache.zookeeper.server.NIOServerCnxnFactory.run(NIOServerCnxnFactory.java:208)
   [junit4]   2>        at java.base/java.lang.Thread.run(Thread.java:844)
   [junit4]   2> 427357 INFO  (jetty-launcher-713-thread-3) [    ] 
o.a.s.c.OverseerElectionContext I am going to be the leader 127.0.0.1:34974_solr
   [junit4]   2> 427358 INFO  (jetty-launcher-713-thread-2) [    ] 
o.a.s.c.ZkController Register node as live in 
ZooKeeper:/live_nodes/127.0.0.1:33485_solr
   [junit4]   2> 427358 INFO  (jetty-launcher-713-thread-1) [    ] 
o.a.s.c.ZkController Register node as live in 
ZooKeeper:/live_nodes/127.0.0.1:37090_solr
   [junit4]   2> 427358 INFO  (jetty-launcher-713-thread-3) [    ] 
o.a.s.c.Overseer Overseer 
(id=97276414012620807-127.0.0.1:34974_solr-n_0000000000) starting
   [junit4]   2> 427359 INFO  (zkCallback-727-thread-1) [    ] 
o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (0) -> (2)
   [junit4]   2> 427359 INFO  (zkCallback-729-thread-1) [    ] 
o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (0) -> (2)
   [junit4]   2> 427359 INFO  (zkCallback-728-thread-1) [    ] 
o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (0) -> (2)
   [junit4]   2> 427364 INFO  (jetty-launcher-713-thread-3) [    ] 
o.a.s.c.ZkController Register node as live in 
ZooKeeper:/live_nodes/127.0.0.1:34974_solr
   [junit4]   2> 427365 INFO  (zkCallback-729-thread-1) [    ] 
o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (2) -> (3)
   [junit4]   2> 427365 INFO  (zkCallback-727-thread-1) [    ] 
o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (2) -> (3)
   [junit4]   2> 427384 INFO  (zkCallback-728-thread-1) [    ] 
o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (2) -> (3)
   [junit4]   2> 427449 INFO  (jetty-launcher-713-thread-3) [    ] 
o.a.s.c.CorePropertiesLocator Found 0 core definitions underneath 
/home/jenkins/workspace/Lucene-Solr-master-Linux/solr/build/solr-core/test/J2/temp/solr.search.stats.TestDistribIDF_F16DCBA044EEBD8B-001/tempDir-001/node3/.
   [junit4]   2> 427583 INFO  (jetty-launcher-713-thread-2) [    ] 
o.a.s.c.CorePropertiesLocator Found 0 core definitions underneath 
/home/jenkins/workspace/Lucene-Solr-master-Linux/solr/build/solr-core/test/J2/temp/solr.search.stats.TestDistribIDF_F16DCBA044EEBD8B-001/tempDir-001/node2/.
   [junit4]   2> 427655 INFO  (jetty-launcher-713-thread-1) [    ] 
o.a.s.c.CorePropertiesLocator Found 0 core definitions underneath 
/home/jenkins/workspace/Lucene-Solr-master-Linux/solr/build/solr-core/test/J2/temp/solr.search.stats.TestDistribIDF_F16DCBA044EEBD8B-001/tempDir-001/node1/.
   [junit4]   2> 429377 INFO  
(TEST-TestDistribIDF.testSimpleQuery-seed#[F16DCBA044EEBD8B]) [    ] 
o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (0) -> (3)
   [junit4]   2> 429377 INFO  
(TEST-TestDistribIDF.testSimpleQuery-seed#[F16DCBA044EEBD8B]) [    ] 
o.a.s.c.s.i.ZkClientClusterStateProvider Cluster at 127.0.0.1:38067/solr ready
   [junit4]   2> 429379 INFO  (qtp16203997-4023) [    ] 
o.a.s.h.a.CollectionsHandler Invoked Collection Action :create with params 
shards=a,b,c&replicationFactor=1&collection.configName=conf1&maxShardsPerNode=1&name=onecollection&router.name=implicit&action=CREATE&wt=javabin&version=2
 and sendToOCPQueue=true
   [junit4]   2> 429381 INFO  (OverseerThreadFactory-2322-thread-1) [    ] 
o.a.s.c.CreateCollectionCmd Create collection onecollection
   [junit4]   2> 429486 INFO  (qtp2579806-4012) [    ] 
o.a.s.h.a.CoreAdminOperation core create command 
qt=/admin/cores&collection.configName=conf1&newCollection=true&name=onecollection_c_replica1&action=CREATE&numShards=3&collection=onecollection&shard=c&wt=javabin&version=2
   [junit4]   2> 429486 INFO  (qtp16203997-4025) [    ] 
o.a.s.h.a.CoreAdminOperation core create command 
qt=/admin/cores&collection.configName=conf1&newCollection=true&name=onecollection_b_replica1&action=CREATE&numShards=3&collection=onecollection&shard=b&wt=javabin&version=2
   [junit4]   2> 429486 INFO  (qtp15978462-4010) [    ] 
o.a.s.h.a.CoreAdminOperation core create command 
qt=/admin/cores&collection.configName=conf1&newCollection=true&name=onecollection_a_replica1&action=CREATE&numShards=3&collection=onecollection&shard=a&wt=javabin&version=2
   [junit4]   2> 429591 INFO  (zkCallback-727-thread-3) [    ] 
o.a.s.c.c.ZkStateReader A cluster state change: [WatchedEvent 
state:SyncConnected type:NodeDataChanged 
path:/collections/onecollection/state.json] for collection [onecollection] has 
occurred - updating... (live nodes size: [3])
   [junit4]   2> 429591 INFO  (zkCallback-728-thread-1) [    ] 
o.a.s.c.c.ZkStateReader A cluster state change: [WatchedEvent 
state:SyncConnected type:NodeDataChanged 
path:/collections/onecollection/state.json] for collection [onecollection] has 
occurred - updating... (live nodes size: [3])
   [junit4]   2> 429591 INFO  (zkCallback-729-thread-1) [    ] 
o.a.s.c.c.ZkStateReader A cluster state change: [WatchedEvent 
state:SyncConnected type:NodeDataChanged 
path:/collections/onecollection/state.json] for collection [onecollection] has 
occurred - updating... (live nodes size: [3])
   [junit4]   2> 430511 WARN  (qtp2579806-4012) [    ] o.a.s.c.Config Beginning 
with Solr 5.5, <mergePolicy> is deprecated, use <mergePolicyFactory> instead.
   [junit4]   2> 430514 INFO  (qtp2579806-4012) [    ] o.a.s.c.SolrConfig Using 
Lucene MatchVersion: 7.0.0
   [junit4]   2> 430516 WARN  (qtp15978462-4010) [    ] o.a.s.c.Config 
Beginning with Solr 5.5, <mergePolicy> is deprecated, use <mergePolicyFactory> 
instead.
   [junit4]   2> 430516 WARN  (qtp16203997-4025) [    ] o.a.s.c.Config 
Beginning with Solr 5.5, <mergePolicy> is deprecated, use <mergePolicyFactory> 
instead.
   [junit4]   2> 430518 INFO  (qtp15978462-4010) [    ] o.a.s.c.SolrConfig 
Using Lucene MatchVersion: 7.0.0
   [junit4]   2> 430518 INFO  (qtp16203997-4025) [    ] o.a.s.c.SolrConfig 
Using Lucene MatchVersion: 7.0.0
   [junit4]   2> 430542 INFO  (qtp2579806-4012) [    ] o.a.s.s.IndexSchema 
[onecollection_c_replica1] Schema name=test
   [junit4]   2> 430568 INFO  (qtp16203997-4025) [    ] o.a.s.s.IndexSchema 
[onecollection_b_replica1] Schema name=test
   [junit4]   2> 430568 INFO  (qtp15978462-4010) [    ] o.a.s.s.IndexSchema 
[onecollection_a_replica1] Schema name=test
   [junit4]   2> 430644 WARN  (qtp2579806-4012) [    ] o.a.s.s.IndexSchema 
[onecollection_c_replica1] default search field in schema is text. WARNING: 
Deprecated, please use 'df' on request instead.
   [junit4]   2> 430646 INFO  (qtp2579806-4012) [    ] o.a.s.s.IndexSchema 
Loaded schema test/1.0 with uniqueid field id
   [junit4]   2> 430652 INFO  (qtp2579806-4012) [    ] o.a.s.c.CoreContainer 
Creating SolrCore 'onecollection_c_replica1' using configuration from 
collection onecollection
   [junit4]   2> 430652 INFO  (qtp2579806-4012) [    ] o.a.s.c.SolrCore 
[[onecollection_c_replica1] ] Opening new SolrCore at 
[/home/jenkins/workspace/Lucene-Solr-master-Linux/solr/build/solr-core/test/J2/temp/solr.search.stats.TestDistribIDF_F16DCBA044EEBD8B-001/tempDir-001/node2/onecollection_c_replica1],
 
dataDir=[/home/jenkins/workspace/Lucene-Solr-master-Linux/solr/build/solr-core/test/J2/temp/solr.search.stats.TestDistribIDF_F16DCBA044EEBD8B-001/tempDir-001/node2/./onecollection_c_replica1/data/]
   [junit4]   2> 430653 INFO  (qtp2579806-4012) [    ] o.a.s.c.JmxMonitoredMap 
JMX monitoring is enabled. Adding Solr mbeans to JMX Server: 
com.sun.jmx.mbeanserver.JmxMBeanServer@8b167c
   [junit4]   2> 430663 INFO  (qtp2579806-4012) [    ] 
o.a.s.u.RandomMergePolicy RandomMergePolicy wrapping class 
org.apache.lucene.index.LogDocMergePolicy: [LogDocMergePolicy: 
minMergeSize=1000, mergeFactor=14, maxMergeSize=9223372036854775807, 
maxMergeSizeForForcedMerge=9223372036854775807, calibrateSizeByDeletes=true, 
maxMergeDocs=2147483647, maxCFSSegmentSizeMB=8.796093022207999E12, 
noCFSRatio=0.25802457145063673]
   [junit4]   2> 430668 WARN  (qtp15978462-4010) [    ] o.a.s.s.IndexSchema 
[onecollection_a_replica1] default search field in schema is text. WARNING: 
Deprecated, please use 'df' on request instead.
   [junit4]   2> 430668 WARN  (qtp16203997-4025) [    ] o.a.s.s.IndexSchema 
[onecollection_b_replica1] default search field in schema is text. WARNING: 
Deprecated, please use 'df' on request instead.
   [junit4]   2> 430670 INFO  (qtp15978462-4010) [    ] o.a.s.s.IndexSchema 
Loaded schema test/1.0 with uniqueid field id
   [junit4]   2> 430670 INFO  (qtp16203997-4025) [    ] o.a.s.s.IndexSchema 
Loaded schema test/1.0 with uniqueid field id
   [junit4]   2> 430678 INFO  (qtp16203997-4025) [    ] o.a.s.c.CoreContainer 
Creating SolrCore 'onecollection_b_replica1' using configuration from 
collection onecollection
   [junit4]   2> 430678 INFO  (qtp15978462-4010) [    ] o.a.s.c.CoreContainer 
Creating SolrCore 'onecollection_a_replica1' using configuration from 
collection onecollection
   [junit4]   2> 430678 INFO  (qtp16203997-4025) [    ] o.a.s.c.SolrCore 
[[onecollection_b_replica1] ] Opening new SolrCore at 
[/home/jenkins/workspace/Lucene-Solr-master-Linux/solr/build/solr-core/test/J2/temp/solr.search.stats.TestDistribIDF_F16DCBA044EEBD8B-001/tempDir-001/node3/onecollection_b_replica1],
 
dataDir=[/home/jenkins/workspace/Lucene-Solr-master-Linux/solr/build/solr-core/test/J2/temp/solr.search.stats.TestDistribIDF_F16DCBA044EEBD8B-001/tempDir-001/node3/./onecollection_b_replica1/data/]
   [junit4]   2> 430678 INFO  (qtp15978462-4010) [    ] o.a.s.c.SolrCore 
[[onecollection_a_replica1] ] Opening new SolrCore at 
[/home/jenkins/workspace/Lucene-Solr-master-Linux/solr/build/solr-core/test/J2/temp/solr.search.stats.TestDistribIDF_F16DCBA044EEBD8B-001/tempDir-001/node1/onecollection_a_replica1],
 
dataDir=[/home/jenkins/workspace/Lucene-Solr-master-Linux/solr/build/solr-core/test/J2/temp/solr.search.stats.TestDistribIDF_F16DCBA044EEBD8B-001/tempDir-001/node1/./onecollection_a_replica1/data/]
   [junit4]   2> 430678 INFO  (qtp16203997-4025) [    ] o.a.s.c.JmxMonitoredMap 
JMX monitoring is enabled. Adding Solr mbeans to JMX Server: 
com.sun.jmx.mbeanserver.JmxMBeanServer@8b167c
   [junit4]   2> 430678 INFO  (qtp15978462-4010) [    ] o.a.s.c.JmxMonitoredMap 
JMX monitoring is enabled. Adding Solr mbeans to JMX Server: 
com.sun.jmx.mbeanserver.JmxMBeanServer@8b167c
   [junit4]   2> 430680 INFO  (qtp16203997-4025) [    ] 
o.a.s.u.RandomMergePolicy RandomMergePolicy wrapping class 
org.apache.lucene.index.LogDocMergePolicy: [LogDocMergePolicy: 
minMergeSize=1000, mergeFactor=14, maxMergeSize=9223372036854775807, 
maxMergeSizeForForcedMerge=9223372036854775807, calibrateSizeByDeletes=true, 
maxMergeDocs=2147483647, maxCFSSegmentSizeMB=8.796093022207999E12, 
noCFSRatio=0.25802457145063673]
   [junit4]   2> 430680 INFO  (qtp15978462-4010) [    ] 
o.a.s.u.RandomMergePolicy RandomMergePolicy wrapping class 
org.apache.lucene.index.LogDocMergePolicy: [LogDocMergePolicy: 
minMergeSize=1000, mergeFactor=14, maxMergeSize=9223372036854775807, 
maxMergeSizeForForcedMerge=9223372036854775807, calibrateSizeByDeletes=true, 
maxMergeDocs=2147483647, maxCFSSegmentSizeMB=8.796093022207999E12, 
noCFSRatio=0.25802457145063673]
   [junit4]   2> 430695 INFO  (qtp2579806-4012) [    ] o.a.s.u.UpdateHandler 
Using UpdateLog implementation: org.apache.solr.update.UpdateLog
   [junit4]   2> 430695 INFO  (qtp2579806-4012) [    ] o.a.s.u.UpdateLog 
Initializing UpdateLog: dataDir= defaultSyncLevel=FLUSH numRecordsToKeep=100 
maxNumLogsToKeep=10 numVersionBuckets=65536
   [junit4]   2> 430697 INFO  (qtp2579806-4012) [    ] o.a.s.u.CommitTracker 
Hard AutoCommit: disabled
   [junit4]   2> 430697 INFO  (qtp2579806-4012) [    ] o.a.s.u.CommitTracker 
Soft AutoCommit: disabled
   [junit4]   2> 430697 INFO  (qtp2579806-4012) [    ] 
o.a.s.u.RandomMergePolicy RandomMergePolicy wrapping class 
org.apache.lucene.index.LogDocMergePolicy: [LogDocMergePolicy: 
minMergeSize=1000, mergeFactor=28, maxMergeSize=9223372036854775807, 
maxMergeSizeForForcedMerge=9223372036854775807, calibrateSizeByDeletes=true, 
maxMergeDocs=2147483647, maxCFSSegmentSizeMB=8.796093022207999E12, 
noCFSRatio=0.2953670508014361]
   [junit4]   2> 430698 INFO  (qtp2579806-4012) [    ] 
o.a.s.s.SolrIndexSearcher Opening [Searcher@b7fe3[onecollection_c_replica1] 
main]
   [junit4]   2> 430699 INFO  (qtp2579806-4012) [    ] 
o.a.s.h.c.SpellCheckComponent Initializing spell checkers
   [junit4]   2> 430700 INFO  (qtp15978462-4010) [    ] o.a.s.u.UpdateHandler 
Using UpdateLog implementation: org.apache.solr.update.UpdateLog
   [junit4]   2> 430700 INFO  (qtp15978462-4010) [    ] o.a.s.u.UpdateLog 
Initializing UpdateLog: dataDir= defaultSyncLevel=FLUSH numRecordsToKeep=100 
maxNumLogsToKeep=10 numVersionBuckets=65536
   [junit4]   2> 430700 INFO  (qtp16203997-4025) [    ] o.a.s.u.UpdateHandler 
Using UpdateLog implementation: org.apache.solr.update.UpdateLog
   [junit4]   2> 430700 INFO  (qtp16203997-4025) [    ] o.a.s.u.UpdateLog 
Initializing UpdateLog: dataDir= defaultSyncLevel=FLUSH numRecordsToKeep=100 
maxNumLogsToKeep=10 numVersionBuckets=65536
   [junit4]   2> 430702 INFO  (qtp15978462-4010) [    ] o.a.s.u.CommitTracker 
Hard AutoCommit: disabled
   [junit4]   2> 430702 INFO  (qtp15978462-4010) [    ] o.a.s.u.CommitTracker 
Soft AutoCommit: disabled
   [junit4]   2> 430702 INFO  (qtp16203997-4025) [    ] o.a.s.u.CommitTracker 
Hard AutoCommit: disabled
   [junit4]   2> 430702 INFO  (qtp16203997-4025) [    ] o.a.s.u.CommitTracker 
Soft AutoCommit: disabled
   [junit4]   2> 430702 INFO  (qtp15978462-4010) [    ] 
o.a.s.u.RandomMergePolicy RandomMergePolicy wrapping class 
org.apache.lucene.index.LogDocMergePolicy: [LogDocMergePolicy: 
minMergeSize=1000, mergeFactor=28, maxMergeSize=9223372036854775807, 
maxMergeSizeForForcedMerge=9223372036854775807, calibrateSizeByDeletes=true, 
maxMergeDocs=2147483647, maxCFSSegmentSizeMB=8.796093022207999E12, 
noCFSRatio=0.2953670508014361]
   [junit4]   2> 430702 INFO  (qtp16203997-4025) [    ] 
o.a.s.u.RandomMergePolicy RandomMergePolicy wrapping class 
org.apache.lucene.index.LogDocMergePolicy: [LogDocMergePolicy: 
minMergeSize=1000, mergeFactor=28, maxMergeSize=9223372036854775807, 
maxMergeSizeForForcedMerge=9223372036854775807, calibrateSizeByDeletes=true, 
maxMergeDocs=2147483647, maxCFSSegmentSizeMB=8.796093022207999E12, 
noCFSRatio=0.2953670508014361]
   [junit4]   2> 430702 INFO  (qtp15978462-4010) [    ] 
o.a.s.s.SolrIndexSearcher Opening [Searcher@da7317[onecollection_a_replica1] 
main]
   [junit4]   2> 430703 INFO  (qtp16203997-4025) [    ] 
o.a.s.s.SolrIndexSearcher Opening [Searcher@8d9b0b[onecollection_b_replica1] 
main]
   [junit4]   2> 430703 INFO  (qtp15978462-4010) [    ] 
o.a.s.h.c.SpellCheckComponent Initializing spell checkers
   [junit4]   2> 430703 INFO  (qtp16203997-4025) [    ] 
o.a.s.h.c.SpellCheckComponent Initializing spell checkers
   [junit4]   2> 430755 INFO  (qtp16203997-4025) [    ] 
o.a.s.s.DirectSolrSpellChecker init: 
{name=direct,classname=DirectSolrSpellChecker,field=lowerfilt,minQueryLength=3}
   [junit4]   2> 430755 INFO  (qtp2579806-4012) [    ] 
o.a.s.s.DirectSolrSpellChecker init: 
{name=direct,classname=DirectSolrSpellChecker,field=lowerfilt,minQueryLength=3}
   [junit4]   2> 430755 INFO  (qtp15978462-4010) [    ] 
o.a.s.s.DirectSolrSpellChecker init: 
{name=direct,classname=DirectSolrSpellChecker,field=lowerfilt,minQueryLength=3}
   [junit4]   2> 431350 INFO  (qtp15978462-4010) [    ] 
o.a.s.h.ReplicationHandler Commits will be reserved for  10000
   [junit4]   2> 431350 INFO  (qtp2579806-4012) [    ] 
o.a.s.h.ReplicationHandler Commits will be reserved for  10000
   [junit4]   2> 431351 INFO  (qtp16203997-4025) [    ] 
o.a.s.h.ReplicationHandler Commits will be reserved for  10000
   [junit4]   2> 431351 INFO  (searcherExecutor-2331-thread-1) [    ] 
o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: default
   [junit4]   2> 431351 INFO  (searcherExecutor-2329-thread-1) [    ] 
o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: default
   [junit4]   2> 431351 INFO  (searcherExecutor-2330-thread-1) [    ] 
o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: default
   [junit4]   2> 431351 INFO  (searcherExecutor-2331-thread-1) [    ] 
o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: direct
   [junit4]   2> 431351 INFO  (searcherExecutor-2331-thread-1) [    ] 
o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: wordbreak
   [junit4]   2> 431351 INFO  (searcherExecutor-2331-thread-1) [    ] 
o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: 
multipleFields
   [junit4]   2> 431351 INFO  (searcherExecutor-2329-thread-1) [    ] 
o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: direct
   [junit4]   2> 431351 INFO  (searcherExecutor-2329-thread-1) [    ] 
o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: wordbreak
   [junit4]   2> 431351 INFO  (searcherExecutor-2330-thread-1) [    ] 
o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: direct
   [junit4]   2> 431352 INFO  (searcherExecutor-2330-thread-1) [    ] 
o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: wordbreak
   [junit4]   2> 431352 INFO  (searcherExecutor-2331-thread-1) [    ] 
o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: jarowinkler
   [junit4]   2> 431351 INFO  (searcherExecutor-2329-thread-1) [    ] 
o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: 
multipleFields
   [junit4]   2> 431352 INFO  (qtp15978462-4010) [    ] o.a.s.u.UpdateLog Could 
not find max version in index or recent updates, using new clock 
1556422628547231744
   [junit4]   2> 431352 INFO  (searcherExecutor-2330-thread-1) [    ] 
o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: 
multipleFields
   [junit4]   2> 431353 INFO  (searcherExecutor-2331-thread-1) [    ] 
o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: external
   [junit4]   2> 431353 INFO  (qtp2579806-4012) [    ] o.a.s.u.UpdateLog Could 
not find max version in index or recent updates, using new clock 
1556422628548280320
   [junit4]   2> 431353 INFO  (searcherExecutor-2330-thread-1) [    ] 
o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: jarowinkler
   [junit4]   2> 431353 INFO  (searcherExecutor-2331-thread-1) [    ] 
o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: freq
   [junit4]   2> 431353 INFO  (qtp16203997-4025) [    ] o.a.s.u.UpdateLog Could 
not find max version in index or recent updates, using new clock 
1556422628548280320
   [junit4]   2> 431354 INFO  (searcherExecutor-2331-thread-1) [    ] 
o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: fqcn
   [junit4]   2> 431354 INFO  (searcherExecutor-2329-thread-1) [    ] 
o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: jarowinkler
   [junit4]   2> 431354 INFO  (searcherExecutor-2330-thread-1) [    ] 
o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: external
   [junit4]   2> 431355 INFO  (searcherExecutor-2331-thread-1) [    ] 
o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: perDict
   [junit4]   2> 431355 INFO  (searcherExecutor-2329-thread-1) [    ] 
o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: external
   [junit4]   2> 431355 INFO  (searcherExecutor-2330-thread-1) [    ] 
o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: freq
   [junit4]   2> 431355 INFO  (searcherExecutor-2329-thread-1) [    ] 
o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: freq
   [junit4]   2> 431355 INFO  (searcherExecutor-2330-thread-1) [    ] 
o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: fqcn
   [junit4]   2> 431356 INFO  (searcherExecutor-2331-thread-1) [    ] 
o.a.s.c.SolrCore [onecollection_a_replica1] Registered new searcher 
Searcher@da7317[onecollection_a_replica1] 
main{ExitableDirectoryReader(UninvertingDirectoryReader())}
   [junit4]   2> 431356 INFO  (searcherExecutor-2330-thread-1) [    ] 
o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: perDict
   [junit4]   2> 431356 INFO  (searcherExecutor-2329-thread-1) [    ] 
o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: fqcn
   [junit4]   2> 431357 INFO  (searcherExecutor-2329-thread-1) [    ] 
o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: perDict
   [junit4]   2> 431357 INFO  (searcherExecutor-2330-thread-1) [    ] 
o.a.s.c.SolrCore [onecollection_b_replica1] Registered new searcher 
Searcher@8d9b0b[onecollection_b_replica1] 
main{ExitableDirectoryReader(UninvertingDirectoryReader())}
   [junit4]   2> 431357 INFO  (searcherExecutor-2329-thread-1) [    ] 
o.a.s.c.SolrCore [onecollection_c_replica1] Registered new searcher 
Searcher@b7fe3[onecollection_c_replica1] 
main{ExitableDirectoryReader(UninvertingDirectoryReader())}
   [junit4]   2> 431358 INFO  (qtp2579806-4012) [    ] 
o.a.s.c.ShardLeaderElectionContext Enough replicas found to continue.
   [junit4]   2> 431358 INFO  (qtp15978462-4010) [    ] 
o.a.s.c.ShardLeaderElectionContext Enough replicas found to continue.
   [junit4]   2> 431358 INFO  (qtp2579806-4012) [    ] 
o.a.s.c.ShardLeaderElectionContext I may be the new leader - try and sync
   [junit4]   2> 431358 INFO  (qtp15978462-4010) [    ] 
o.a.s.c.ShardLeaderElectionContext I may be the new leader - try and sync
   [junit4]   2> 431358 INFO  (qtp2579806-4012) [    ] o.a.s.c.SyncStrategy 
Sync replicas to http://127.0.0.1:33485/solr/onecollection_c_replica1/
   [junit4]   2> 431358 INFO  (qtp15978462-4010) [    ] o.a.s.c.SyncStrategy 
Sync replicas to http://127.0.0.1:37090/solr/onecollection_a_replica1/
   [junit4]   2> 431358 INFO  (qtp2579806-4012) [    ] o.a.s.c.SyncStrategy 
Sync Success - now sync replicas to me
   [junit4]   2> 431358 INFO  (qtp15978462-4010) [    ] o.a.s.c.SyncStrategy 
Sync Success - now sync replicas to me
   [junit4]   2> 431358 INFO  (qtp2579806-4012) [    ] o.a.s.c.SyncStrategy 
http://127.0.0.1:33485/solr/onecollection_c_replica1/ has no replicas
   [junit4]   2> 431358 INFO  (qtp15978462-4010) [    ] o.a.s.c.SyncStrategy 
http://127.0.0.1:37090/solr/onecollection_a_replica1/ has no replicas
   [junit4]   2> 431358 INFO  (qtp16203997-4025) [    ] 
o.a.s.c.ShardLeaderElectionContext Enough replicas found to continue.
   [junit4]   2> 431358 INFO  (qtp16203997-4025) [    ] 
o.a.s.c.ShardLeaderElectionContext I may be the new leader - try and sync
   [junit4]   2> 431358 INFO  (qtp16203997-4025) [    ] o.a.s.c.SyncStrategy 
Sync replicas to http://127.0.0.1:34974/solr/onecollection_b_replica1/
   [junit4]   2> 431358 INFO  (qtp16203997-4025) [    ] o.a.s.c.SyncStrategy 
Sync Success - now sync replicas to me
   [junit4]   2> 431358 INFO  (qtp16203997-4025) [    ] o.a.s.c.SyncStrategy 
http://127.0.0.1:34974/solr/onecollection_b_replica1/ has no replicas
   [junit4]   2> 431359 INFO  (zkCallback-729-thread-1) [    ] 
o.a.s.c.c.ZkStateReader A cluster state change: [WatchedEvent 
state:SyncConnected type:NodeDataChanged 
path:/collections/onecollection/state.json] for collection [onecollection] has 
occurred - updating... (live nodes size: [3])
   [junit4]   2> 431359 INFO  (zkCallback-727-thread-3) [    ] 
o.a.s.c.c.ZkStateReader A cluster state change: [WatchedEvent 
state:SyncConnected type:NodeDataChanged 
path:/collections/onecollection/state.json] for collection [onecollection] has 
occurred - updating... (live nodes size: [3])
   [junit4]   2> 431359 INFO  (zkCallback-728-thread-1) [    ] 
o.a.s.c.c.ZkStateReader A cluster state change: [WatchedEvent 
state:SyncConnected type:NodeDataChanged 
path:/collections/onecollection/state.json] for collection [onecollection] has 
occurred - updating... (live nodes size: [3])
   [junit4]   2> 431360 INFO  (qtp2579806-4012) [    ] 
o.a.s.c.ShardLeaderElectionContext I am the new leader: 
http://127.0.0.1:33485/solr/onecollection_c_replica1/ c
   [junit4]   2> 431360 INFO  (qtp15978462-4010) [    ] 
o.a.s.c.ShardLeaderElectionContext I am the new leader: 
http://127.0.0.1:37090/solr/onecollection_a_replica1/ a
   [junit4]   2> 431361 INFO  (qtp16203997-4025) [    ] 
o.a.s.c.ShardLeaderElectionContext I am the new leader: 
http://127.0.0.1:34974/solr/onecollection_b_replica1/ b
   [junit4]   2> 431464 INFO  (zkCallback-729-thread-1) [    ] 
o.a.s.c.c.ZkStateReader A cluster state change: [WatchedEvent 
state:SyncConnected type:NodeDataChanged 
path:/collections/onecollection/state.json] for collection [onecollection] has 
occurred - updating... (live nodes size: [3])
   [junit4]   2> 431464 INFO  (zkCallback-728-thread-1) [    ] 
o.a.s.c.c.ZkStateReader A cluster state change: [WatchedEvent 
state:SyncConnected type:NodeDataChanged 
path:/collections/onecollection/state.json] for collection [onecollection] has 
occurred - updating... (live nodes size: [3])
   [junit4]   2> 431464 INFO  (zkCallback-727-thread-3) [    ] 
o.a.s.c.c.ZkStateReader A cluster state change: [WatchedEvent 
state:SyncConnected type:NodeDataChanged 
path:/collections/onecollection/state.json] for collection [onecollection] has 
occurred - updating... (live nodes size: [3])
   [junit4]   2> 431511 INFO  (qtp15978462-4010) [    ] o.a.s.c.ZkController I 
am the leader, no recovery necessary
   [junit4]   2> 431511 INFO  (qtp16203997-4025) [    ] o.a.s.c.ZkController I 
am the leader, no recovery necessary
   [junit4]   2> 431511 INFO  (qtp2579806-4012) [    ] o.a.s.c.ZkController I 
am the leader, no recovery necessary
   [junit4]   2> 431513 INFO  (qtp2579806-4012) [    ] o.a.s.s.HttpSolrCall 
[admin] webapp=null path=/admin/cores 
params={qt=/admin/cores&collection.configName=conf1&newCollection=true&name=onecollection_c_replica1&action=CREATE&numShards=3&collection=onecollection&shard=c&wt=javabin&version=2}
 status=0 QTime=2026
   [junit4]   2> 431513 INFO  (qtp15978462-4010) [    ] o.a.s.s.HttpSolrCall 
[admin] webapp=null path=/admin/cores 
params={qt=/admin/cores&collection.configName=conf1&newCollection=true&name=onecollection_a_replica1&action=CREATE&numShards=3&collection=onecollection&shard=a&wt=javabin&version=2}
 status=0 QTime=2026
   [junit4]   2> 431513 INFO  (qtp16203997-4025) [    ] o.a.s.s.HttpSolrCall 
[admin] webapp=null path=/admin/cores 
params={qt=/admin/cores&collection.configName=conf1&newCollection=true&name=onecollection_b_replica1&action=CREATE&numShards=3&collection=onecollection&shard=b&wt=javabin&version=2}
 status=0 QTime=2026
   [junit4]   2> 431515 INFO  (qtp16203997-4023) [    ] 
o.a.s.h.a.CollectionsHandler Wait for new collection to be active for at most 
30 seconds. Check all shard replicas
   [junit4]   2> 431616 INFO  (zkCallback-729-thread-1) [    ] 
o.a.s.c.c.ZkStateReader A cluster state change: [WatchedEvent 
state:SyncConnected type:NodeDataChanged 
path:/collections/onecollection/state.json] for collection [onecollection] has 
occurred - updating... (live nodes size: [3])
   [junit4]   2> 431616 INFO  (zkCallback-727-thread-1) [    ] 
o.a.s.c.c.ZkStateReader A cluster state change: [WatchedEvent 
state:SyncConnected type:NodeDataChanged 
path:/collections/onecollection/state.json] for collection [onecollection] has 
occurred - updating... (live nodes size: [3])
   [junit4]   2> 431616 INFO  (zkCallback-728-thread-1) [    ] 
o.a.s.c.c.ZkStateReader A cluster state change: [WatchedEvent 
state:SyncConnected type:NodeDataChanged 
path:/collections/onecollection/state.json] for collection [onecollection] has 
occurred - updating... (live nodes size: [3])
   [junit4]   2> 432515 INFO  (qtp16203997-4023) [    ] o.a.s.s.HttpSolrCall 
[admin] webapp=null path=/admin/collections 
params={shards=a,b,c&replicationFactor=1&collection.configName=conf1&maxShardsPerNode=1&name=onecollection&router.name=implicit&action=CREATE&wt=javabin&version=2}
 status=0 QTime=3136
   [junit4]   2> 432516 INFO  
(TEST-TestDistribIDF.testSimpleQuery-seed#[F16DCBA044EEBD8B]) [    ] 
o.a.s.c.AbstractDistribZkTestBase Wait for recoveries to finish - collection: 
onecollection failOnTimeout:true timeout (sec):100
   [junit4]   2> 432516 INFO  
(TEST-TestDistribIDF.testSimpleQuery-seed#[F16DCBA044EEBD8B]) [    ] 
o.a.s.c.AbstractDistribZkTestBase Recoveries finished - collection: 
onecollection
   [junit4]   2> 432517 INFO  (qtp16203997-4024) [    ] 
o.a.s.h.a.CollectionsHandler Invoked Collection Action :create with params 
shards=a,b,c&replicationFactor=1&collection.configName=conf2&maxShardsPerNode=1&name=onecollection_local&router.name=implicit&action=CREATE&wt=javabin&version=2
 and sendToOCPQueue=true
   [junit4]   2> 432518 INFO  (OverseerThreadFactory-2322-thread-2) [    ] 
o.a.s.c.CreateCollectionCmd Create collection onecollection_local
   [junit4]   2> 432518 INFO  
(OverseerCollectionConfigSetProcessor-97276414012620807-127.0.0.1:34974_solr-n_0000000000)
 [    ] o.a.s.c.OverseerTaskQueue Response ZK path: 
/overseer/collection-queue-work/qnr-0000000000 doesn't exist.  Requestor may 
have disconnected from ZooKeeper
   [junit4]   2> 432721 INFO  (qtp2579806-4016) [    ] 
o.a.s.h.a.CoreAdminOperation core create command 
qt=/admin/cores&collection.configName=conf2&newCollection=true&name=onecollection_local_c_replica1&action=CREATE&numShards=3&collection=onecollection_local&shard=c&wt=javabin&version=2
   [junit4]   2> 432721 INFO  (qtp16203997-4011) [    ] 
o.a.s.h.a.CoreAdminOperation core create command 
qt=/admin/cores&collection.configName=conf2&newCollection=true&name=onecollection_local_a_replica1&action=CREATE&numShards=3&collection=onecollection_local&shard=a&wt=javabin&version=2
   [junit4]   2> 432721 INFO  (qtp15978462-4013) [    ] 
o.a.s.h.a.CoreAdminOperation core create command 
qt=/admin/cores&collection.configName=conf2&newCollection=true&name=onecollection_local_b_replica1&action=CREATE&numShards=3&collection=onecollection_local&shard=b&wt=javabin&version=2
   [junit4]   2> 432826 INFO  (zkCallback-728-thread-1) [    ] 
o.a.s.c.c.ZkStateReader A cluster state change: [WatchedEvent 
state:SyncConnected type:NodeDataChanged 
path:/collections/onecollection_local/state.json] for collection 
[onecollection_local] has occurred - updating... (live nodes size: [3])
   [junit4]   2> 432826 INFO  (zkCallback-729-thread-1) [    ] 
o.a.s.c.c.ZkStateReader A cluster state change: [WatchedEvent 
state:SyncConnected type:NodeDataChanged 
path:/collections/onecollection_local/state.json] for collection 
[onecollection_local] has occurred - updating... (live nodes size: [3])
   [junit4]   2> 432826 INFO  (zkCallback-727-thread-1) [    ] 
o.a.s.c.c.ZkStateReader A cluster state change: [WatchedEvent 
state:SyncConnected type:NodeDataChanged 
path:/collections/onecollection_local/state.json] for collection 
[onecollection_local] has occurred - updating... (live nodes size: [3])
   [junit4]   2> 433734 INFO  (qtp15978462-4013) [    ] o.a.s.c.SolrConfig 
Using Lucene MatchVersion: 7.0.0
   [junit4]   2> 433734 INFO  (qtp2579806-4016) [    ] o.a.s.c.SolrConfig Using 
Lucene MatchVersion: 7.0.0
   [junit4]   2> 433734 INFO  (qtp16203997-4011) [    ] o.a.s.c.SolrConfig 
Using Lucene MatchVersion: 7.0.0
   [junit4]   2> 433741 INFO  (qtp2579806-4016) [    ] o.a.s.s.IndexSchema 
[onecollection_local_c_replica1] Schema name=minimal
   [junit4]   2> 433741 INFO  (qtp15978462-4013) [    ] o.a.s.s.IndexSchema 
[onecollection_local_b_replica1] Schema name=minimal
   [junit4]   2> 433749 INFO  (qtp16203997-4011) [    ] o.a.s.s.IndexSchema 
[onecollection_local_a_replica1] Schema name=minimal
   [junit4]   2> 433749 INFO  (qtp2579806-4016) [    ] o.a.s.s.IndexSchema 
Loaded schema minimal/1.1 with uniqueid field id
   [junit4]   2> 433749 INFO  (qtp15978462-4013) [    ] o.a.s.s.IndexSchema 
Loaded schema minimal/1.1 with uniqueid field id
   [junit4]   2> 433749 INFO  (qtp2579806-4016) [    ] o.a.s.c.CoreContainer 
Creating SolrCore 'onecollection_local_c_replica1' using configuration from 
collection onecollection_local
   [junit4]   2> 433750 INFO  (qtp15978462-4013) [    ] o.a.s.c.CoreContainer 
Creating SolrCore 'onecollection_local_b_replica1' using configuration from 
collection onecollection_local
   [junit4]   2> 433750 INFO  (qtp2579806-4016) [    ] o.a.s.c.SolrCore 
[[onecollection_local_c_replica1] ] Opening new SolrCore at 
[/home/jenkins/workspace/Lucene-Solr-master-Linux/solr/build/solr-core/test/J2/temp/solr.search.stats.TestDistribIDF_F16DCBA044EEBD8B-001/tempDir-001/node2/onecollection_local_c_replica1],
 
dataDir=[/home/jenkins/workspace/Lucene-Solr-master-Linux/solr/build/solr-core/test/J2/temp/solr.search.stats.TestDistribIDF_F16DCBA044EEBD8B-001/tempDir-001/node2/./onecollection_local_c_replica1/data/]
   [junit4]   2> 433750 INFO  (qtp15978462-4013) [    ] o.a.s.c.SolrCore 
[[onecollection_local_b_replica1] ] Opening new SolrCore at 
[/home/jenkins/workspace/Lucene-Solr-master-Linux/solr/build/solr-core/test/J2/temp/solr.search.stats.TestDistribIDF_F16DCBA044EEBD8B-001/tempDir-001/node1/onecollection_local_b_replica1],
 
dataDir=[/home/jenkins/workspace/Lucene-Solr-master-Linux/solr/build/solr-core/test/J2/temp/solr.search.stats.TestDistribIDF_F16DCBA044EEBD8B-001/tempDir-001/node1/./onecollection_local_b_replica1/data/]
   [junit4]   2> 433750 INFO  (qtp16203997-4011) [    ] o.a.s.s.IndexSchema 
Loaded schema minimal/1.1 with uniqueid field id
   [junit4]   2> 433751 INFO  (qtp16203997-4011) [    ] o.a.s.c.CoreContainer 
Creating SolrCore 'onecollection_local_a_replica1' using configuration from 
collection onecollection_local
   [junit4]   2> 433751 INFO  (qtp16203997-4011) [    ] o.a.s.c.SolrCore 
[[onecollection_local_a_replica1] ] Opening new SolrCore at 
[/home/jenkins/workspace/Lucene-Solr-master-Linux/solr/build/solr-core/test/J2/temp/solr.search.stats.TestDistribIDF_F16DCBA044EEBD8B-001/tempDir-001/node3/onecollection_local_a_replica1],
 
dataDir=[/home/jenkins/workspace/Lucene-Solr-master-Linux/solr/build/solr-core/test/J2/temp/solr.search.stats.TestDistribIDF_F16DCBA044EEBD8B-001/tempDir-001/node3/./onecollection_local_a_replica1/data/]
   [junit4]   2> 433762 INFO  (qtp2579806-4016) [    ] o.a.s.u.CommitTracker 
Hard AutoCommit: disabled
   [junit4]   2> 433762 INFO  (qtp2579806-4016) [    ] o.a.s.u.CommitTracker 
Soft AutoCommit: disabled
   [junit4]   2> 433763 INFO  (qtp2579806-4016) [    ] 
o.a.s.s.SolrIndexSearcher Opening 
[Searcher@5ce153[onecollection_local_c_replica1] main]
   [junit4]   2> 433763 INFO  (qtp2579806-4016) [    ] 
o.a.s.r.ManagedResourceStorage Configured ZooKeeperStorageIO with znodeBase: 
/configs/conf2
   [junit4]   2> 433763 INFO  (qtp2579806-4016) [    ] 
o.a.s.r.ManagedResourceStorage Loaded null at path _rest_managed.json using 
ZooKeeperStorageIO:path=/configs/conf2
   [junit4]   2> 433764 INFO  (qtp2579806-4016) [    ] 
o.a.s.h.ReplicationHandler Commits will be reserved for  10000
   [junit4]   2> 433764 INFO  (searcherExecutor-2344-thread-1) [    ] 
o.a.s.c.SolrCore [onecollection_local_c_replica1] Registered new searcher 
Searcher@5ce153[onecollection_local_c_replica1] 
main{ExitableDirectoryReader(UninvertingDirectoryReader())}
   [junit4]   2> 433768 INFO  (qtp16203997-4011) [    ] o.a.s.u.CommitTracker 
Hard AutoCommit: disabled
   [junit4]   2> 433768 INFO  (qtp16203997-4011) [    ] o.a.s.u.CommitTracker 
Soft AutoCommit: disabled
   [junit4]   2> 433768 INFO  (qtp15978462-4013) [    ] o.a.s.u.CommitTracker 
Hard AutoCommit: disabled
   [junit4]   2> 433768 INFO  (qtp15978462-4013) [    ] o.a.s.u.CommitTracker 
Soft AutoCommit: disabled
   [junit4]   2> 433769 INFO  (qtp15978462-4013) [    ] 
o.a.s.s.SolrIndexSearcher Opening 
[Searcher@1f4ec4d[onecollection_local_b_replica1] main]
   [junit4]   2> 433769 INFO  (qtp16203997-4011) [    ] 
o.a.s.s.SolrIndexSearcher Opening 
[Searcher@1a1ff39[onecollection_local_a_replica1] main]
   [junit4]   2> 433770 INFO  (qtp2579806-4016) [    ] 
o.a.s.c.ShardLeaderElectionContext Enough replicas found to continue.
   [junit4]   2> 433770 INFO  (qtp2579806-4016) [    ] 
o.a.s.c.ShardLeaderElectionContext I may be the new leader - try and sync
   [junit4]   2> 433770 INFO  (qtp2579806-4016) [    ] o.a.s.c.SyncStrategy 
Sync replicas to http://127.0.0.1:33485/solr/onecollection_local_c_replica1/
   [junit4]   2> 433770 ERROR (qtp2579806-4016) [    ] o.a.s.c.SyncStrategy No 
UpdateLog found - cannot sync
   [junit4]   2> 433770 INFO  (qtp2579806-4016) [    ] 
o.a.s.c.ShardLeaderElectionContext We failed sync, but we have no versions - we 
can't sync in that case - we were active before, so become leader anyway
   [junit4]   2> 433770 INFO  (qtp15978462-4013) [    ] 
o.a.s.r.ManagedResourceStorage Configured ZooKeeperStorageIO with znodeBase: 
/configs/conf2
   [junit4]   2> 433770 INFO  (qtp16203997-4011) [    ] 
o.a.s.r.ManagedResourceStorage Configured ZooKeeperStorageIO with znodeBase: 
/configs/conf2
   [junit4]   2> 433770 INFO  (qtp15978462-4013) [    ] 
o.a.s.r.ManagedResourceStorage Loaded null at path _rest_managed.json using 
ZooKeeperStorageIO:path=/configs/conf2
   [junit4]   2> 433770 INFO  (qtp15978462-4013) [    ] 
o.a.s.h.ReplicationHandler Commits will be reserved for  10000
   [junit4]   2> 433770 INFO  (qtp16203997-4011) [    ] 
o.a.s.r.ManagedResourceStorage Loaded null at path _rest_managed.json using 
ZooKeeperStorageIO:path=/configs/conf2
   [junit4]   2> 433771 INFO  (searcherExecutor-2345-thread-1) [    ] 
o.a.s.c.SolrCore [onecollection_local_b_replica1] Registered new searcher 
Searcher@1f4ec4d[onecollection_local_b_replica1] 
main{ExitableDirectoryReader(UninvertingDirectoryReader())}
   [junit4]   2> 433771 INFO  (qtp16203997-4011) [    ] 
o.a.s.h.ReplicationHandler Commits will be reserved for  10000
   [junit4]   2> 433771 INFO  (searcherExecutor-2346-thread-1) [    ] 
o.a.s.c.SolrCore [onecollection_local_a_replica1] Registered new searcher 
Searcher@1a1ff39[onecollection_local_a_replica1] 
main{ExitableDirectoryReader(UninvertingDirectoryReader())}
   [junit4]   2> 433773 INFO  (qtp2579806-4016) [    ] 
o.a.s.c.ShardLeaderElectionContext I am the new leader: 
http://127.0.0.1:33485/solr/onecollection_local_c_replica1/ c
   [junit4]   2> 433774 INFO  (qtp15978462-4013) [    ] 
o.a.s.c.ShardLeaderElectionContext Enough replicas found to continue.
   [junit4]   2> 433774 INFO  (qtp16203997-4011) [    ] 
o.a.s.c.ShardLeaderElectionContext Enough replicas found to continue.
   [junit4]   2> 433774 INFO  (qtp16203997-4011) [    ] 
o.a.s.c.ShardLeaderElectionContext I may be the new leader - try and sync
   [junit4]   2> 433774 INFO  (qtp15978462-4013) [    ] 
o.a.s.c.ShardLeaderElectionContext I may be the new leader - try and sync
   [junit4]   2> 433774 INFO  (qtp16203997-4011) [    ] o.a.s.c.SyncStrategy 
Sync replicas to http://127.0.0.1:34974/solr/onecollection_local_a_replica1/
   [junit4]   2> 433774 INFO  (qtp15978462-4013) [    ] o.a.s.c.SyncStrategy 
Sync replicas to http://127.0.0.1:37090/solr/onecollection_local_b_replica1/
   [junit4]   2> 433774 ERROR (qtp16203997-4011) [    ] o.a.s.c.SyncStrategy No 
UpdateLog found - cannot sync
   [junit4]   2> 433774 ERROR (qtp15978462-4013) [    ] o.a.s.c.SyncStrategy No 
UpdateLog found - cannot sync
   [junit4]   2> 433774 INFO  (qtp16203997-4011) [    ] 
o.a.s.c.ShardLeaderElectionContext We failed sync, but we have no versions - we 
can't sync in that case - we were active before, so become leader anyway
   [junit4]   2> 433774 INFO  (qtp15978462-4013) [    ] 
o.a.s.c.ShardLeaderElectionContext We failed sync, but we have no versions - we 
can't sync in that case - we were active before, so become leader anyway
   [junit4]   2> 433777 INFO  (qtp15978462-4013) [    ] 
o.a.s.c.ShardLeaderElectionContext I am the new leader: 
http://127.0.0.1:37090/solr/onecollection_local_b_replica1/ b
   [junit4]   2> 433777 INFO  (qtp16203997-4011) [    ] 
o.a.s.c.ShardLeaderElectionContext I am the new leader: 
http://127.0.0.1:34974/solr/onecollection_local_a_replica1/ a
   [junit4]   2> 433880 INFO  (zkCallback-727-thread-3) [    ] 
o.a.s.c.c.ZkStateReader A cluster state change: [WatchedEvent 
state:SyncConnected type:NodeDataChanged 
path:/collections/onecollection_local/state.json] for collection 
[onecollection_local] has occurred - updating... (live nodes size: [3])
   [junit4]   2> 433880 INFO  (zkCallback-729-thread-1) [    ] 
o.a.s.c.c.ZkStateReader A cluster state change: [WatchedEvent 
state:SyncConnected type:NodeDataChanged 
path:/collections/onecollection_local/state.json] for collection 
[onecollection_local] has occurred - updating... (live nodes size: [3])
   [junit4]   2> 433880 INFO  (zkCallback-728-thread-1) [    ] 
o.a.s.c.c.ZkStateReader A cluster state change: [WatchedEvent 
state:SyncConnected type:NodeDataChanged 
path:/collections/onecollection_local/state.json] for collection 
[onecollection_local] has occurred - updating... (live nodes size: [3])
   [junit4]   2> 433923 INFO  (qtp2579806-4016) [    ] o.a.s.c.ZkController I 
am the leader, no recovery necessary
   [junit4]   2> 433925 INFO  (qtp2579806-4016) [    ] o.a.s.s.HttpSolrCall 
[admin] webapp=null path=/admin/cores 
params={qt=/admin/cores&collection.configName=conf2&newCollection=true&name=onecollection_local_c_replica1&action=CREATE&numShards=3&collection=onecollection_local&shard=c&wt=javabin&version=2}
 status=0 QTime=1203
   [junit4]   2> 433928 INFO  (qtp16203997-4011) [    ] o.a.s.c.ZkController I 
am the leader, no recovery necessary
   [junit4]   2> 433928 INFO  (qtp15978462-4013) [    ] o.a.s.c.ZkController I 
am the leader, no recovery necessary
   [junit4]   2> 433929 INFO  (qtp16203997-4011) [    ] o.a.s.s.HttpSolrCall 
[admin] webapp=null path=/admin/cores 
params={qt=/admin/cores&collection.configName=conf2&newCollection=true&name=onecollection_local_a_replica1&action=CREATE&numShards=3&collection=onecollection_local&shard=a&wt=javabin&version=2}
 status=0 QTime=1208
   [junit4]   2> 433929 INFO  (qtp15978462-4013) [    ] o.a.s.s.HttpSolrCall 
[admin] webapp=null path=/admin/cores 
params={qt=/admin/cores&collection.configName=conf2&newCollection=true&name=onecollection_local_b_replica1&action=CREATE&numShards=3&collection=onecollection_local&shard=b&wt=javabin&version=2}
 status=0 QTime=1208
   [junit4]   2> 433931 INFO  (qtp16203997-4024) [    ] 
o.a.s.h.a.CollectionsHandler Wait for new collection to be active for at most 
30 seconds. Check all shard replicas
   [junit4]   2> 434031 INFO  (zkCallback-727-thread-1) [    ] 
o.a.s.c.c.ZkStateReader A cluster state change: [WatchedEvent 
state:SyncConnected type:NodeDataChanged 
path:/collections/onecollection_local/state.json] for collection 
[onecollection_local] has occurred - updating... (live nodes size: [3])
   [junit4]   2> 434031 INFO  (zkCallback-729-thread-1) [    ] 
o.a.s.c.c.ZkStateReader A cluster state change: [WatchedEvent 
state:SyncConnected type:NodeDataChanged 
path:/collections/onecollection_local/state.json] for collection 
[onecollection_local] has occurred - updating... (live nodes size: [3])
   [junit4]   2> 434031 INFO  (zkCallback-728-thread-1) [    ] 
o.a.s.c.c.ZkStateReader A cluster state change: [WatchedEvent 
state:SyncConnected type:NodeDataChanged 
path:/collections/onecollection_local/state.json] for collection 
[onecollection_local] has occurred - updating... (live nodes size: [3])
   [junit4]   2> 434519 INFO  
(OverseerCollectionConfigSetProcessor-97276414012620807-127.0.0.1:34974_solr-n_0000000000)
 [    ] o.a.s.c.OverseerTaskQueue Response ZK path: 
/overseer/collection-queue-work/qnr-0000000002 doesn't exist.  Requestor may 
have disconnected from ZooKeeper
   [junit4]   2> 434931 INFO  (qtp16203997-4024) [    ] o.a.s.s.HttpSolrCall 
[admin] webapp=null path=/admin/collections 
params={shards=a,b,c&replicationFactor=1&collection.configName=conf2&maxShardsPerNode=1&name=onecollection_local&router.name=implicit&action=CREATE&wt=javabin&version=2}
 status=0 QTime=2414
   [junit4]   2> 434932 INFO  
(TEST-TestDistribIDF.testSimpleQuery-seed#[F16DCBA044EEBD8B]) [    ] 
o.a.s.c.AbstractDistribZkTestBase Wait for recoveries to finish - collection: 
onecollection_local failOnTimeout:true timeout (sec):100
   [junit4]   2> 434932 INFO  
(TEST-TestDistribIDF.testSimpleQuery-seed#[F16DCBA044EEBD8B]) [    ] 
o.a.s.c.AbstractDistribZkTestBase Recoveries finished - collection: 
onecollection_local
   [junit4]   2> 434937 INFO  (qtp15978462-4000) [    ] 
o.a.s.u.p.LogUpdateProcessorFactory [onecollection_a_replica1]  webapp=/solr 
path=/update 
params={update.distrib=TOLEADER&distrib.from=http://127.0.0.1:33485/solr/onecollection_c_replica1/&wt=javabin&version=2}{add=[1
 (1556422632304279552)]} 0 1
   [junit4]   2> 434937 INFO  (qtp2579806-4001) [    ] 
o.a.s.u.p.LogUpdateProcessorFactory [onecollection_c_replica1]  webapp=/solr 
path=/update params={wt=javabin&version=2}{add=[1]} 0 3
   [junit4]   2> 434939 INFO  (qtp16203997-4015) [    ] 
o.a.s.u.p.LogUpdateProcessorFactory [onecollection_local_a_replica1]  
webapp=/solr path=/update params={wt=javabin&version=2}{add=[1]} 0 0
   [junit4]   2> 434940 INFO  (qtp16203997-4023) [    ] 
o.a.s.u.p.LogUpdateProcessorFactory [onecollection_b_replica1]  webapp=/solr 
path=/update params={wt=javabin&version=2}{add=[2 (1556422632308473856)]} 0 1
   [junit4]   2> 434941 INFO  (qtp15978462-4010) [    ] 
o.a.s.u.p.LogUpdateProcessorFactory [onecollection_local_b_replica1]  
webapp=/solr path=/update 
params={update.distrib=TOLEADER&distrib.from=http://127.0.0.1:33485/solr/onecollection_local_c_replica1/&wt=javabin&version=2}{add=[2]}
 0 0
   [junit4]   2> 434942 INFO  (qtp2579806-4012) [    ] 
o.a.s.u.p.LogUpdateProcessorFactory [onecollection_local_c_replica1]  
webapp=/solr path=/update params={wt=javabin&version=2}{add=[2]} 0 1
   [junit4]   2> 434942 INFO  (qtp16203997-4011) [    ] 
o.a.s.u.p.LogUpdateProcessorFactory [onecollection_b_replica1]  webapp=/solr 
path=/update params={wt=javabin&version=2}{add=[3 (1556422632311619584)]} 0 0
   [junit4]   2> 434945 INFO  (qtp15978462-4002) [    ] 
o.a.s.u.p.LogUpdateProcessorFactory [onecollection_local_b_replica1]  
webapp=/solr path=/update 
params={update.distrib=TOLEADER&distrib.from=http://127.0.0.1:34974/solr/onecollection_local_a_replica1/&wt=javabin&version=2}{add=[3]}
 0 0
   [junit4]   2> 434945 INFO  (qtp16203997-4024) [    ] 
o.a.s.u.p.LogUpdateProcessorFactory [onecollection_local_a_replica1]  
webapp=/solr path=/update params={wt=javabin&version=2}{add=[3]} 0 2
   [junit4]   2> 434946 INFO  (qtp16203997-4015) [    ] 
o.a.s.u.p.LogUpdateProcessorFactory [onecollection_b_replica1]  webapp=/solr 
path=/update params={wt=javabin&version=2}{add=[4 (1556422632315813888)]} 0 0
   [junit4]   2> 434947 INFO  (qtp15978462-4000) [    ] 
o.a.s.u.p.LogUpdateProcessorFactory [onecollection_local_b_replica1]  
webapp=/solr path=/update 
params={update.distrib=TOLEADER&distrib.from=http://127.0.0.1:34974/solr/onecollection_local_a_replica1/&wt=javabin&version=2}{add=[4]}
 0 0
   [junit4]   2> 434947 INFO  (qtp16203997-4023) [    ] 
o.a.s.u.p.LogUpdateProcessorFactory [onecollection_local_a_replica1]  
webapp=/solr path=/update params={wt=javabin&version=2}{add=[4]} 0 0
   [junit4]   2> 434948 INFO  (qtp16203997-4024) [    ] 
o.a.s.u.p.LogUpdateProcessorFactory [onecollection_b_replica1]  webapp=/solr 
path=/update 
params={update.distrib=TOLEADER&distrib.from=http://127.0.0.1:33485/solr/onecollection_c_replica1/&wt=javabin&version=2}{add=[5
 (1556422632317911040)]} 0 0
   [junit4]   2> 434948 INFO  (qtp2579806-4016) [    ] 
o.a.s.u.p.LogUpdateProcessorFactory [onecollection_c_replica1]  webapp=/solr 
path=/update params={wt=javabin&version=2}{add=[5]} 0 0
   [junit4]   2> 434949 INFO  (qtp15978462-4010) [    ] 
o.a.s.u.p.LogUpdateProcessorFactory [onecollection_local_b_replica1]  
webapp=/solr path=/update 
params={update.distrib=TOLEADER&distrib.from=http://127.0.0.1:34974/solr/onecollection_local_a_replica1/&wt=javabin&version=2}{add=[5]}
 0 0
   [junit4]   2> 434949 INFO  (qtp16203997-4011) [    ] 
o.a.s.u.p.LogUpdateProcessorFactory [onecollection_local_a_replica1]  
webapp=/solr path=/update params={wt=javabin&version=2}{add=[5]} 0 0
   [junit4]   2> 434950 INFO  (qtp16203997-4017) [    ] 
o.a.s.u.p.LogUpdateProcessorFactory [onecollection_b_replica1]  webapp=/solr 
path=/update 
params={update.distrib=TOLEADER&distrib.from=http://127.0.0.1:37090/solr/onecollection_a_replica1/&wt=javabin&version=2}{add=[6
 (1556422632320008192)]} 0 0
   [junit4]   2> 434950 INFO  (qtp15978462-4002) [    ] 
o.a.s.u.p.LogUpdateProcessorFactory [onecollection_a_replica1]  webapp=/solr 
path=/update params={wt=javabin&version=2}{add=[6]} 0 0
   [junit4]   2> 434951 INFO  (qtp15978462-4013) [    ] 
o.a.s.u.p.LogUpdateProcessorFactory [onecollection_local_b_replica1]  
webapp=/solr path=/update 
params={update.distrib=TOLEADER&distrib.from=http://127.0.0.1:33485/solr/onecollection_local_c_replica1/&wt=javabin&version=2}{add=[6]}
 0 0
   [junit4]   2> 434951 INFO  (qtp2579806-4003) [    ] 
o.a.s.u.p.LogUpdateProcessorFactory [onecollection_local_c_replica1]  
webapp=/solr path=/update params={wt=javabin&version=2}{add=[6]} 0 0
   [junit4]   2> 434952 INFO  (qtp16203997-4023) [    ] 
o.a.s.u.p.LogUpdateProcessorFactory [onecollection_b_replica1]  webapp=/solr 
path=/update params={wt=javabin&version=2}{add=[7 (1556422632322105344)]} 0 0
   [junit4]   2> 434953 INFO  (qtp15978462-4004) [    ] 
o.a.s.u.p.LogUpdateProcessorFactory [onecollection_local_b_replica1]  
webapp=/solr path=/update 
params={update.distrib=TOLEADER&distrib.from=http://127.0.0.1:34974/solr/onecollection_local_a_replica1/&wt=javabin&version=2}{add=[7]}
 0 0
   [junit4]   2> 434954 INFO  (qtp16203997-4011) [    ] 
o.a.s.u.p.LogUpdateProcessorFactory [onecollection_local_a_replica1]  
webapp=/solr path=/update params={wt=javabin&version=2}{add=[7]} 0 1
   [junit4]   2> 434954 INFO  (qtp16203997-4020) [    ] 
o.a.s.u.p.LogUpdateProcessorFactory [onecollection_b_replica1]  webapp=/solr 
path=/update params={wt=javabin&version=2}{add=[8 (1556422632324202496)]} 0 0
   [junit4]   2> 434954 INFO  (qtp15978462-4000) [    ] 
o.a.s.u.p.LogUpdateProcessorFactory [onecollection_local_b_replica1]  
webapp=/solr path=/update params={wt=javabin&version=2}{add=[8]} 0 0
   [junit4]   2> 434955 INFO  (qtp16203997-4024) [    ] 
o.a.s.u.p.LogUpdateProcessorFactory [onecollection_b_replica1]  webapp=/solr 
path=/update 
params={update.distrib=TOLEADER&distrib.from=http://127.0.0.1:37090/solr/onecollection_a_replica1/&wt=javabin&version=2}{add=[9
 (1556422632325251072)]} 0 0
   [junit4]   2> 434955 INFO  (qtp15978462-4002) [    ] 
o.a.s.u.p.LogUpdateProcessorFactory [onecollection_a_replica1]  webapp=/solr 
path=/update params={wt=javabin&version=2}{add=[9]} 0 0
   [junit4]   2> 434956 INFO  (qtp15978462-4010) [    ] 
o.a.s.u.p.LogUpdateProcessorFactory [onecollection_local_b_replica1]  
webapp=/solr path=/update 
params={update.distrib=TOLEADER&distrib.from=http://127.0.0.1:33485/solr/onecollection_local_c_replica1/&wt=javabin&version=2}{add=[9]}
 0 0
   [junit4]   2> 434956 INFO  (qtp2579806-4001) [    ] 
o.a.s.u.p.LogUpdateProcessorFactory [onecollection_local_c_replica1]  
webapp=/solr path=/update params={wt=javabin&version=2}{add=[9]} 0 0
   [junit4]   2> 434957 INFO  (qtp16203997-4023) [    ] 
o.a.s.u.p.LogUpdateProcessorFactory [onecollection_b_replica1]  webapp=/solr 
path=/update 
params={update.distrib=TOLEADER&distrib.from=http://127.0.0.1:37090/solr/onecollection_a_replica1/&wt=javabin&version=2}{add=[10
 (1556422632327348224)]} 0 0
   [junit4]   2> 434957 INFO  (qtp15978462-4013) [    ] 
o.a.s.u.p.LogUpdateProcessorFactory [onecollection_a_replica1]  webapp=/solr 
path=/update params={wt=javabin&version=2}{add=[10]} 0 0
   [junit4]   2> 434958 INFO  (qtp15978462-4006) [    ] 
o.a.s.u.p.LogUpdateProcessorFactory [onecollection_local_b_replica1]  
webapp=/solr path=/update 
params={update.distrib=TOLEADER&distrib.from=http://127.0.0.1:34974/solr/onecollection_local_a_replica1/&wt=javabin&version=2}{add=[10]}
 0 0
   [junit4]   2> 434958 INFO  (qtp16203997-4017) [    ] 
o.a.s.u.p.LogUpdateProcessorFactory [onecollection_local_a_replica1]  
webapp=/solr path=/update params={wt=javabin&version=2}{add=[10]} 0 0
   [junit4]   2> 434959 INFO  (qtp16203997-4015) [    ] 
o.a.s.u.p.LogUpdateProcessorFactory [onecollection_b_replica1]  webapp=/solr 
path=/update 
params={update.distrib=TOLEADER&distrib.from=http://127.0.0.1:33485/solr/onecollection_c_replica1/&wt=javabin&version=2}{add=[11
 (1556422632328396800)]} 0 0
   [junit4]   2> 434959 INFO  (qtp2579806-4012) [    ] 
o.a.s.u.p.LogUpdateProcessorFactory [onecollection_c_replica1]  webapp=/solr 
path=/update params={wt=javabin&version=2}{add=[11]} 0 0
   [junit4]   2> 434959 INFO  (qtp15978462-4000) [    ] 
o.a.s.u.p.LogUpdateProcessorFactory [onecollection_local_b_replica1]  
webapp=/solr path=/update params={wt=javabin&version=2}{add=[11]} 0 0
   [junit4]   2> 434959 INFO  (qtp16203997-4020) [    ] 
o.a.s.u.p.LogUpdateProcessorFactory [onecollection_b_replica1]  webapp=/solr 
path=/update params={wt=javabin&version=2}{add=[12 (1556422632329445376)]} 0 0
   [junit4]   2> 434960 INFO  (qtp15978462-4004) [    ] 
o.a.s.u.p.LogUpdateProcessorFactory [onecollection_local_b_replica1]  
webapp=/solr path=/update 
params={update.distrib=TOLEADER&distrib.from=http://127.0.0.1:33485/solr/onecollection_local_c_replica1/&wt=javabin&version=2}{add=[12]}
 0 0
   [junit4]   2> 434960 INFO  (qtp2579806-4016) [    ] 
o.a.s.u.p.LogUpdateProcessorFactory [onecollection_local_c_replica1]  
webapp=/solr path=/update params={wt=javabin&version=2}{add=[12]} 0 0
   [junit4]   2> 434961 INFO  (qtp16203997-4011) [    ] 
o.a.s.u.p.LogUpdateProcessorFactory [onecollection_b_replica1]  webapp=/solr 
path=/update 
params={update.distrib=TOLEADER&distrib.from=http://127.0.0.1:37090/solr/onecollection_a_replica1/&wt=javabin&version=2}{add=[13
 (1556422632331542528)]} 0 0
   [junit4]   2> 434961 INFO  (qtp15978462-4010) [    ] 
o.a.s.u.p.LogUpdateProcessorFactory [onecollection_a_replica1]  webapp=/solr 
path=/update params={wt=javabin&version=2}{add=[13]} 0 0
   [junit4]   2> 434962 INFO  (qtp15978462-4013) [    ] 
o.a.s.u.p.LogUpdateProcessorFactory [onecollection_local_b_replica1]  
webapp=/solr path=/update 
params={update.distrib=TOLEADER&distrib.from=http://127.0.0.1:33485/solr/onecollection_local_c_replica1/&wt=javabin&version=2}{add=[13]}
 0 0
   [junit4]   2> 434962 INFO  (qtp2579806-4003) [    ] 
o.a.s.u.p.LogUpdateProcessorFactory [onecollection_local_c_replica1]  
webapp=/solr path=/update params={wt=javabin&version=2}{add=[13]} 0 0
   [junit4]   2> 434962 INFO  (qtp16203997-4023) [    ] 
o.a.s.u.p.LogUpdateProcessorFactory [onecollection_b_replica1]  webapp=/solr 
path=/update params={wt=javabin&version=2}{add=[14 (1556422632332591104)]} 0 0
   [junit4]   2> 434963 INFO  (qtp15978462-4002) [    ] 
o.a.s.u.p.LogUpdateProcessorFactory [onecollection_local_b_replica1]  
webapp=/solr path=/update 
params={update.distrib=TOLEADER&distrib.from=http://127.0.0.1:34974/solr/onecollection_local_a_replica1/&wt=javabin&version=2}{add=[14]}
 0 0
   [junit4]   2> 434963 INFO  (qtp16203997-4015) [    ] 
o.a.s.u.p.LogUpdateProcessorFactory [onecollection_local_a_replica1]  
webapp=/solr path=/update params={wt=javabin&version=2}{add=[14]} 0 0
   [junit4]   2> 434963 INFO  (qtp16203997-4020) [    ] 
o.a.s.u.p.LogUpdateProcessorFactory [onecollection_b_replica1]  webapp=/solr 
path=/update params={wt=javabin&version=2}{add=[15 (1556422632333639680)]} 0 0
   [junit4]   2> 434964 INFO  (qtp15978462-4004) [    ] 
o.a.s.u.p.LogUpdateProcessorFactory [onecollection_local_b_replica1]  
webapp=/solr path=/update 
params={update.distrib=TOLEADER&distrib.from=http://127.0.0.1:34974/solr/onecollection_local_a_replica1/&wt=javabin&version=2}{add=[15]}
 0 0
   [junit4]   2> 434964 INFO  (qtp16203997-4011) [    ] 
o.a.s.u.p.LogUpdateProcessorFactory [onecollection_local_a_replica1]  
webapp=/solr path=/update params={wt=javabin&version=2}{add=[15]} 0 0
   [junit4]   2> 434966 INFO  (qtp16203997-4024) [    ] 
o.a.s.u.p.LogUpdateProcessorFactory [onecollection_b_replica1]  webapp=/solr 
path=/update 
params={update.distrib=TOLEADER&distrib.from=http://127.0.0.1:33485/solr/onecollection_c_replica1/&wt=javabin&version=2}{add=[16
 (1556422632336785408)]} 0 0
   [junit4]   2> 434966 INFO  (qtp2579806-4001) [    ] 
o.a.s.u.p.LogUpdateProcessorFactory [onecollection_c_replica1]  webapp=/solr 
path=/update params={wt=javabin&version=2}{add=[16]} 0 0
   [junit4]   2> 434966 INFO  (qtp15978462-4010) [    ] 
o.a.s.u.p.LogUpdateProcessorFactory [onecollection_local_b_replica1]  
webapp=/solr path=/update 
params={update.distrib=TOLEADER&distrib.from=http://127.0.0.1:34974/solr/onecollection_local_a_replica1/&wt=javabin&version=2}{add=[16]}
 0 0
   [junit4]   2> 434966 INFO  (qtp16203997-4023) [    ] 
o.a.s.u.p.LogUpdateProcessorFactory [onecollection_local_a_replica1]  
webapp=/solr path=/update params={wt=javabin&version=2}{add=[16]} 0 0
   [junit4]   2> 434967 INFO  (qtp16203997-4020) [    ] 
o.a.s.u.p.LogUpdateProcessorFactory [onecollection_b_replica1]  webapp=/solr 
path=/update params={wt=javabin&version=2}{add=[17 (1556422632337833984)]} 0 0
   [junit4]   2> 434968 INFO  (qtp15978462-4013) [    ] 
o.a.s.u.p.LogUpdateProcessorFactory [onecollection_local_b_replica1]  
webapp=/solr path=/update 
params={update.distrib=TOLEADER&distrib.from=http://127.0.0.1:34974/solr/onecollection_local_a_replica1/&wt=javabin&version=2}{add=[17]}
 0 0
   [junit4]   2> 434968 INFO  (qtp16203997-4011) [    ] 
o.a.s.u.p.LogUpdateProcessorFactory [onecollection_local_a_replica1]  
webapp=/solr path=/update params={wt=javabin&version=2}{add=[17]} 0 0
   [junit4]   2> 434968 INFO  (qtp16203997-4024) [    ] 
o.a.s.u.p.LogUpdateProcessorFactory [onecollection_b_replica1]  webapp=/solr 
path=/update params={wt=javabin&version=2}{add=[18 (1556422632338882560)]} 0 0
   [junit4]   2> 434969 INFO  (qtp15978462-4002) [    ] 
o.a.s.u.p.LogUpdateProcessorFactory [onecollection_local_b_replica1]  
webapp=/solr path=/update 
params={update.distrib=TOLEADER&distrib.from=http://127.0.0.1:34974/solr/onecollection_local_a_replica1/&wt=javabin&version=2}{add=[18]}
 0 0
   [junit4]   2> 434969 INFO  (qtp16203997-4023) [    ] 
o.a.s.u.p.LogUpdateProcessorFactory [onecollection_local_a_replica1]  
webapp=/solr path=/update params={wt=javabin&version=2}{add=[18]} 0 0
   [junit4]   2> 434969 INFO  (qtp16203997-4020) [    ] 
o.a.s.u.p.LogUpdateProcessorFactory [onecollection_b_replica1]  webapp=/solr 
path=/update params={wt=javabin&version=2}{add=[19 (1556422632339931136)]} 0 0
   [junit4]   2> 434970 INFO  (qtp15978462-4004) [    ] 
o.a.s.u.p.LogUpdateProcessorFactory [onecollection_local_b_replica1]  
webapp=/solr path=/update 
params={update.distrib=TOLEADER&distrib.from=http://127.0.0.1:34974/solr/onecollection_local_a_replica1/&wt=javabin&version=2}{add=[19]}
 0 0
   [junit4]   2> 434970 INFO  (qtp16203997-4011) [    ] 
o.a.s.u.p.LogUpdateProcessorFactory [onecollection_local_a_replica1]  
webapp=/solr path=/update params={wt=javabin&version=2}{add=[19]} 0 0
   [junit4]   2> 434971 INFO  (qtp16203997-4015) [    ] 
o.a.s.u.p.LogUpdateProcessorFactory [onecollection_b_replica1]  webapp=/solr 
path=/update 
params={update.distrib=TOLEADER&distrib.from=http://127.0.0.1:33485/solr/onecollection_c_replica1/&wt=javabin&version=2}{add=[20
 (1556422632342028288)]} 0 0
   [junit4]   2> 434971 INFO  (qtp2579806-4012) [    ] 
o.a.s.u.p.LogUpdateProcessorFactory [onecollection_c_replica1]  webapp=/solr 
path=/update params={wt=javabin&version=2}{add=[20]} 0 0
   [junit4]   2> 434971 INFO  (qtp15978462-4000) [    ] 
o.a.s.u.p.LogUpdateProcessorFactory [onecollection_local_b_replica1]  
webapp=/solr path=/update 
params={update.distrib=TOLEADER&distrib.from=http://127.0.0.1:33485/solr/onecollection_local_c_replica1/&wt=javabin&version=2}{add=[20]}
 0 0
   [junit4]   2> 434972 INFO  (qtp2579806-4016) [    ] 
o.a.s.u.p.LogUpdateProcessorFactory [onecollection_local_c_replica1]  
webapp=/solr path=/update params={wt=javabin&version=2}{add=[20]} 0 0
   [junit4]   2> 434972 INFO  (qtp16203997-4017) [    ] 
o.a.s.u.p.LogUpdateProcessorFactory [onecollection_b_replica1]  webapp=/solr 
path=/update 
params={update.distrib=TOLEADER&distrib.from=http://127.0.0.1:37090/solr/onecollection_a_replica1/&wt=javabin&version=2}{add=[21
 (1556422632343076864)]} 0 0
   [junit4]   2> 434972 INFO  (qtp15978462-4006) [    ] 
o.a.s.u.p.LogUpdateProcessorFactory [onecollection_a_replica1]  webapp=/solr 
path=/update params={wt=javabin&version=2}{add=[21]} 0 0
   [junit4]   2> 434973 INFO  (qtp15978462-4000) [    ] 
o.a.s.u.p.LogUpdateProcessorFactory [onecollection_local_b_replica1]  
webapp=/solr path=/update 
params={update.distrib=TOLEADER&distrib.from=http://127.0.0.1:33485/solr/onecollection_local_c_replica1/&wt=javabin&version=2}{add=[21]}
 0 0
   [junit4]   2> 434973 INFO  (qtp2579806-4003) [    ] 
o.a.s.u.p.LogUpdateProcessorFactory [onecollection_local_c_replica1]  
webapp=/solr path=/update params={wt=javabin&version=2}{add=[21]} 0 0
   [junit4]   2> 434973 INFO  (qtp16203997-4024) [    ] 
o.a.s.u.p.LogUpdateProcessorFactory [onecollection_b_replica1]  webapp=/solr 
path=/update params={wt=javabin&version=2}{add=[22 (1556422632344125440)]} 0 0
   [junit4]   2> 434974 INFO  (qtp15978462-4004) [    ] 
o.a.s.u.p.LogUpdateProcessorFactory [onecollection_local_b_replica1]  
webapp=/solr path=/update 
params={update.distrib=TOLEADER&distrib.from=http://127.0.0.1:33485/solr/onecollection_local_c_replica1/&wt=javabin&version=2}{add=[22]}
 0 0
   [junit4]   2> 434974 INFO  (qtp2579806-4001) [    ] 
o.a.s.u.p.LogUpdateProcessorFactory [onecollection_local_c_replica1]  
webapp=/solr path=/update params={wt=javabin&version=2}{add=[22]} 0 0
   [junit4]   2> 434974 INFO  (qtp16203997-4011) [    ] 
o.a.s.u.p.LogUpdateProcessorFactory [onecollection_b_replica1]  webapp=/solr 
path=/update params={wt=javabin&version=2}{add=[23 (1556422632345174016)]} 0 0
   [junit4]   2> 434975 INFO  (qtp15978462-4010) [    ] 
o.a.s.u.p.LogUpdateProcessorFactory [onecollection_local_b_replica1]  
webapp=/solr path=/update 
params={update.distrib=TOLEADER&distrib.from=http://127.0.0.1:34974/solr/onecollection_local_a_replica1/&wt=javabin&version=2}{add=[23]}
 0 0
   [junit4]   2> 434975 INFO  (qtp16203997-4015) [    ] 
o.a.s.u.p.LogUpdateProcessorFactory [onecollection_local_a_replica1]  
webapp=/solr path=/update params={wt=javabin&version=2}{add=[23]} 0 0
   [junit4]   2> 434976 INFO  (qtp16203997-4017) [    ] 
o.a.s.u.p.LogUpdateProcessorFactory [onecollection_b_replica1]  webapp=/solr 
path=/update params={wt=javabin&version=2}{add=[24 (1556422632347271168)]} 0 0
   [junit4]   2> 434977 INFO  (qtp15978462-4013) [    ] 
o.a.s.u.p.LogUpdateProcessorFactory [onecollection_local_b_replica1]  
webapp=/solr path=/update 
params={update.distrib=TOLEADER&distrib.from=http://127.0.0.1:33485/solr/onecollection_local_c_replica1/&wt=javabin&version=2}{add=[24]}
 0 0
   [junit4]   2> 434977 INFO  (qtp2579806-4012) [    ] 
o.a.s.u.p.LogUpdateProcessorFactory [onecollection_local_c_replica1]  
webapp=/solr path=/update params={wt=javabin&version=2}{add=[24]} 0 1
   [junit4]   2> 434978 INFO  (qtp16203997-4023) [    ] 
o.a.s.u.p.LogUpdateProcessorFactory [onecollection_b_replica1]  webapp=/solr 
path=/update 
params={update.distrib=TOLEADER&distrib.from=http://127.0.0.1:33485/solr/onecollection_c_replica1/&wt=javabin&version=2}{add=[25
 (1556422632349368320)]} 0 0
   [junit4]   2> 434978 INFO  (qtp2579806-4016) [    ] 
o.a.s.u.p.LogUpdateProcessorFactory [onecollection_c_replica1]  webapp=/solr 
path=/update params={wt=javabin&version=2}{add=[25]} 0 0
   [junit4]   2> 434978 INFO  (qtp15978462-4002) [    ] 
o.a.s.u.p.LogUpdateProcessorFactory [onecollection_local_b_replica1]  
webapp=/solr path=/update params={wt=javabin&version=2}{add=[25]} 0 0
   [junit4]   2> 434979 INFO  (qtp16203997-4011) [    ] 
o.a.s.u.p.LogUpdateProcessorFactory [onecollection_b_replica1]  webapp=/solr 
path=/update 
params={update.distrib=TOLEADER&distrib.from=http://127.0.0.1:33485/solr/onecollection_c_replica1/&wt=javabin&version=2}{add=[26
 (1556422632350416896)]} 0 0
   [junit4]   2> 434979 INFO  (qtp2579806-4003) [    ] 
o.a.s.u.p.LogUpdateProcessorFactory [onecollection_c_replica1]  webapp=/solr 
path=/update params={wt=javabin&version=2}{add=[26]} 0 0
   [junit4]   2> 434980 INFO  (qtp15978462-4002) [    ] 
o.a.s.u.p.LogUpdateProcessorFactory [onecollection_local_b_replica1]  
webapp=/solr path=/update params={wt=javabin&version=2}{add=[26]} 0 0
   [junit4]   2> 434980 INFO  (qtp16203997-4024) [    ] 
o.a.s.u.p.LogUpdateProcessorFactory [onecollection_b_replica1]  webapp=/solr 
path=/update params={wt=javabin&version=2}{add=[27 (1556422632351465472)]} 0 0
   [junit4]   2> 434981 INFO  (qtp15978462-4010) [    ] 
o.a.s.u.p.LogUpdateProcessorFactory [onecollection_local_b_replica1]  
webapp=/solr path=/update params={wt=javabin&version=2}{add=[27]} 0 0
   [junit4]   2> 434981 INFO  (qtp16203997-4015) [    ] 
o.a.s.u.p.LogUpdateProcessorFactory [onecollection_b_replica1]  webapp=/solr 
path=/update 
params={update.distrib=TOLEADER&distrib.from=http://127.0.0.1:33485/solr/onecollection_c_replica1/&wt=javabin&version=2}{add=[28
 (1556422632352514048)]} 0 0
   [junit4]   2> 434981 INFO  (qtp2579806-4001) [    ] 
o.a.s.u.p.LogUpdateProcessorFactory [onecollection_c_replica1]  webapp=/solr 
path=/update params={wt=javabin&version=2}{add=[28]} 0 0
   [junit4]   2> 434982 INFO  (qtp15978462-4000) [    ] 
o.a.s.u.p.LogUpdateProcessorFactory [onecollection_local_b_replica1]  
webapp=/solr path=/update 
params={update.distrib=TOLEADER&distrib.from=http://127.0.0.1:33485/solr/onecollection_local_c_replica1/&wt=javabin&version=2}{add=[28]}
 0 0
   [junit4]   2> 434982 INFO  (qtp2579806-4012) [    ] 
o.a.s.u.p.LogUpdateProcessorFactory [onecollection_local_c_replica1]  
webapp=/solr path=/update params={wt=javabin&version=2}{add=[28]} 0 0
   [junit4]   2> 434983 INFO  (qtp16203997-4020) [    ] 
o.a.s.u.p.LogUpdateProcessorFactory [onecollection_b_replica1]  webapp=/solr 
path=/update 
params={update.distrib=TOLEADER&distrib.from=http://127.0.0.1:37090/solr/onecollection_a_replica1/&wt=javabin&version=2}{add=[29
 (1556422632354611200)]} 0 0
   [junit4]   2> 434983 INFO  (qtp15978462-4013) [    ] 
o.a.s.u.p.LogUpdateProcessorFactory [onecollection_a_replica1]  webapp=/solr 
path=/update params={wt=javabin&version=2}{add=[29]} 0 0
   [junit4]   2> 434984 INFO  (qtp15978462-4004) [    ] 
o.a.s.u.p.LogUpdateProcessorFactory [onecollection_local_b_replica1]  
webapp=/solr path=/update 
params={update.distrib=TOLEADER&distrib.from=http://127.0.0.1:33485/solr/onecollection_local_c_replica1/&wt=javabin&version=2}{add=[29]}
 0 0
   [junit4]   2> 434984 INFO  (qtp2579806-4016) [    ] 
o.a.s.u.p.LogUpdateProcessorFactory [onecollection_local_c_replica1]  
webapp=/solr path=/update params={wt=javabin&version=2}{add=[29]} 0 0
   [junit4]   2> 434985 INFO  (qtp16203997-4011) [    ] 
o.a.s.u.p.LogUpdateProcessorFactory [onecollection_b_replica1]  webapp=/solr 
path=/update 
params={update.distrib=TOLEADER&distrib.from=http://127.0.0.1:37090/solr/onecollection_a_replica1/&wt=javabin&version=2}{add=[30
 (1556422632356708352)]} 0 0
   [junit4]   2> 434985 INFO  (qtp15978462-4002) [    ] 
o.a.s.u.p.LogUpdateProcessorFactory [onecollection_a_replica1]  webapp=/solr 
path=/update params={wt=javabin&version=2}{add=[30]} 0 0
   [junit4]   2> 434985 INFO  (qtp15978462-4000) [    ] 
o.a.s.u.p.LogUpdateProcessorFactory [onecollection_local_b_replica1]  
webapp=/solr path=/update params={wt=javabin&version=2}{add=[30]} 0 0
   [junit4]   2> 434986 INFO  (qtp16203997-4023) [    ] 
o.a.s.u.p.LogUpdateProcessorFactory [onecollection_b_replica1]  webapp=/solr 
path=/update 
params={update.distrib=TOLEADER&distrib.from=http://127.0.0.1:33485/solr/onecollection_c_replica1/&wt=javabin&version=2}{add=[31
 (1556422632357756928)]} 0 0
   [junit4]   2> 434986 INFO  (qtp2579806-4003) [    ] 
o.a.s.u.p.LogUpdateProcessorFactory [onecollection_c_replica1]  webapp=/solr 
path=/update params={wt=javabin&version=2}{add=[31]} 0 0
   [junit4]   2> 434986 INFO  (qtp15978462-4013) [    ] 
o.a.s.u.p.LogUpdateProcessorFactory [onecollection_local_b_replica1]  
webapp=/solr path=/update params={wt=javabin&version=2}{add=[31]} 0 0
   [junit4]   2> 434987 INFO  (qtp16203997-4017) [    ] 
o.a.s.u.p.LogUpdateProcessorFactory [onecollection_b_replica1]  webapp=/solr 
path=/update params={wt=javabin&version=2}{add=[32 (1556422632358805504)]} 0 0
   [junit4]   2> 434987 INFO  (qtp15978462-4006) [    ] 
o.a.s.u.p.LogUpdateProcessorFactory [onecollection_local_b_replica1]  
webapp=/solr path=/update 
params={update.distrib=TOLEADER&distrib.from=http://127.0.0.1:34974/solr/onecollection_local_a_replica1/&wt=javabin&version=2}{add=[32]}
 0 0
   [junit4]   2> 434988 INFO  (qtp16203997-4020) [    ] 
o.a.s.u.p.LogUpdateProcessorFactory [onecollection_local_a_replica1]  
webapp=/solr path=/update params={wt=javabin&version=2}{add=[32]} 0 0
   [junit4]   2> 434989 INFO  (qtp16203997-4024) [    ] 
o.a.s.u.p.LogUpdateProcessorFactory [onecollection_b_replica1]  webapp=/solr 
path=/update 
params={update.distrib=TOLEADER&distrib.from=http://127.0.0.1:37090/solr/onecollection_a_replica1/&wt=javabin&version=2}{add=[33
 (1556422632359854080)]} 0 0
   [junit4]   2> 434989 INFO  (qtp15978462-4004) [    ] 
o.a.s.u.p.LogUpdateProcessorFactory [onecollection_a_replica1]  webapp=/solr 
path=/update params={wt=javabin&version=2}{add=[33]} 0 1
   [junit4]   2> 434990 INFO  (qtp15978462-4002) [    ] 
o.a.s.u.p.LogUpdateProcessorFactory [onecollection_local_b_replica1]  
webapp=/solr path=/update 
params={update.distrib=TOLEADER&distrib.from=http://127.0.0.1:34974/solr/onecollection_local_a_replica1/&wt=javabin&version=2}{add=[33]}
 0 0
   [junit4]   2> 434990 INFO  (qtp16203997-4011) [    ] 
o.a.s.u.p.LogUpdateProcessorFactory [onecollection_local_a_replica1]  
webapp=/solr path=/update params={wt=javabin&version=2}{add=[33]} 0 0
   [junit4]   2> 434991 INFO  (qtp16203997-4015) [    ] 
o.a.s.u.p.LogUpdateProcessorFactory [onecollection_b_replica1]  webapp=/solr 
path=/update 
params={update.distrib=TOLEADER&distrib.from=http://127.0.0.1:33485/solr/onecollection_c_replica1/&wt=javabin&version=2}{add=[34
 (1556422632362999808)]} 0 0
   [junit4]   2> 434991 INFO  (qtp2579806-4001) [    ] 
o.a.s.u.p.LogUpdateProcessorFactory [onecollection_c_replica1]  webapp=/solr 
path=/update params={wt=javabin&version=2}{add=[34]} 0 0
   [junit4]   2> 434991 INFO  (qtp15978462-4013) [    ] 
o.a.s.u.p.LogUpdateProcessorFactory [onecollection_local_b_replica1]  
webapp=/solr path=/update 
params={update.distrib=TOLEADER&distrib.from=http://127.0.0.1:34974/solr/onecollection_local_a_replica1/&wt=javabin&version=2}{add=[34]}
 0 0
   [junit4]   2> 434992 INFO  (qtp16203997-4017) [    ] 
o.a.s.u.p.LogUpdateProcessorFactory [onecollection_local_a_replica1]  
webapp=/solr path=/update params={wt=javabin&version=2}{add=[34]} 0 0
   [junit4]   2> 434992 INFO  (qtp16203997-4024) [    ] 
o.a.s.u.p.LogUpdateProcessorFactory [onecollection_b_replica1]  webapp=/solr 
path=/update params={wt=javabin&version=2}{add=[35 (1556422632364048384)]} 0 0
   [junit4]   2> 434993 INFO  (qtp15978462-4006) [    ] 
o.a.s.u.p.LogUpdateProcessorFactory [onecollection_local_b_replica1]  
webapp=/solr path=/update 
params={update.distrib=TOLEADER&distrib.from=http://127.0.0.1:34974/solr/onecollection_local_a_replica1/&wt=javabin&version=2}{add=[35]}
 0 0
   [junit4]   2> 434993 INFO  (qtp16203997-4011) [    ] 
o.a.s.u.p.LogUpdateProcessorFactory [onecollection_local_a_replica1]  
webapp=/solr path=/update params={wt=javabin&version=2}{add=[35]} 0 0
   [junit4]   2> 434993 INFO  (qtp16203997-4023) [    ] 
o.a.s.u.p.LogUpdateProcessorFactory [onecollection_b_replica1]  webapp=/solr 
path=/update 
params={update.distrib=TOLEADER&distrib.from=http://127.0.0.1:37090/solr/onecollection_a_replica1/&wt=javabin&version=2}{add=[36
 (1556422632365096960)]} 0 0
   [junit4]   2> 434993 INFO  (qtp15978462-4000) [    ] 
o.a.s.u.p.LogUpdateProcessorFactory [onecollection_a_replica1]  webapp=/solr 
path=/update params={wt=javabin&version=2}{add=[36]} 0 0
   [junit4]   2> 434994 INFO  (qtp15978462-4004) [    ] 
o.a.s.u.p.LogUpdateProcessorFactory [onecollection_local_b_replica1]  
webapp=/solr path=/update 
params={update.distrib=TOLEADER&distrib.from=http://127.0.0.1:34974/solr/onecollection_local_a_replica1/&wt=javabin&version=2}{add=[36]}
 0 0
   [junit4]   2> 434994 INFO  (qtp16203997-4015) [    ] 
o.a.s.u.p.LogUpdateProcessorFactory [onecollection_local_a_replica1]  
webapp=/solr path=/update params={wt=javabin&version=2}{add=[36]} 0 0
   [junit4]   2> 434995 INFO  (qtp16203997-4020) [    ] 
o.a.s.u.p.LogUpdateProcessorFactory [onecollection_b_replica1]  webapp=/solr 
path=/update 
params={update.distrib=TOLEADER&distrib.from=http://127.0.0.1:33485/solr/onecollection_c_replica1/&wt=javabin&version=2}{add=[37
 (1556422632367194112)]} 0 0
   [junit4]   2> 434995 INFO  (qtp2579806-4012) [    ] 
o.a.s.u.p.LogUpdateProcessorFactory [onecollection_c_replica1]  webapp=/solr 
path=/update params={wt=javabin&version=2}{add=[37]} 0 0
   [junit4]   2> 434996 INFO  (qtp15978462-4002) [    ] 
o.a.s.u.p.LogUpdateProcessorFactory [onecollection_local_b_replica1]  
webapp=/solr path=/update params={wt=javabin&version=2}{add=[37]} 0 0
   [junit4]   2> 434996 INFO  (qtp16203997-4024) [    ] 
o.a.s.u.p.LogUpdateProcessorFactory [onecollection_b_replica1]  webapp=/solr 
path=/update params={wt=javabin&version=2}{add=[38 (1556422632368242688)]} 0 0
   [junit4]   2> 434997 INFO  (qtp15978462-4013) [    ] 
o.a.s.u.p.LogUpdateProcessorFactory [onecollection_local_b_replica1]  
webapp=/solr path=/update 
params={update.distrib=TOLEADER&distrib.from=http://127.0.0.1:34974/solr/onecollection_local_a_replica1/&wt=javabin&version=2}{add=[38]}
 0 0
   [junit4]   2> 434997 INFO  (qtp16203997-4023) [    ] 
o.a.s.u.p.LogUpdateProcessorFactory [onecollection_local_a_replica1]  
webapp=/solr path=/update params={wt=javabin&version=2}{add=[38]} 0 0
   [junit4]   2> 434998 INFO  (qtp16203997-4015) [    ] 
o.a.s.u.p.LogUpdateProcessorFactory [onecollection_b_replica1]  webapp=/solr 
path=/update params={wt=javabin&version=2}{add=[39 (1556422632370339840)]} 0 0
   [junit4]   2> 434998 INFO  (qtp15978462-4006) [    ] 
o.a.s.u.p.LogUpdateProcessorFactory [onecollection_local_b_replica1]  
webapp=/solr path=/update params={wt=javabin&version=2}{add=[39]} 0 0
   [junit4]   2> 434999 INFO  (qtp16203997-4011) [    ] 
o.a.s.u.p.LogUpdateProcessorFactory [onecollection_b_replica1]  webapp=/solr 
path=/update 
params={update.distrib=TOLEADER&distrib.from=http://127.0.0.1:33485/solr/onecollection_c_replica1/&wt=javabin&version=2}{add=[40
 (1556422632371388416)]} 0 0
   [junit4]   2> 434999 INFO  (qtp2579806-4016) [    ] 
o.a.s.u.p.LogUpdateProcessorFactory [onecollection_c_replica1]  webapp=/solr 
path=/update params={wt=javabin&version=2}{add=[40]} 0 0
   [junit4]   2> 435000 INFO  (qtp15978462-4010) [    ] 
o.a.s.u.p.LogUpdateProcessorFactory [onecollection_local_b_replica1]  
webapp=/solr path=/update 
params={update.distrib=TOLEADER&distrib.from=http://127.0.0.1:33485/solr/onecollection_local_c_replica1/&wt=javabin&version=2}{add=[40]}
 0 0
   [junit4]   2> 435000 INFO  (qtp2579806-4003) [    ] 
o.a.s.u.p.LogUpdateProcessorFactory [onecollection_local_c_replica1]  
webapp=/solr path=/update params={wt=javabin&version=2}{add=[40]} 0 0
   [junit4]   2> 435001 INFO  (qtp16203997-4024) [    ] 
o.a.s.u.p.LogUpdateProcessorFactory [onecollection_b_replica1]  webapp=/solr 
path=/update 
params={update.distrib=TOLEADER&distrib.from=http://127.0.0.1:33485/solr/onecollection_c_replica1/&wt=javabin&version=2}{add=[41
 (1556422632373485568)]} 0 0
   [junit4]   2> 435001 INFO  (qtp2579806-4001) [    ] 
o.a.s.u.p.LogUpdateProcessorFactory [onecollection_c_replica1]  webapp=/solr 
path=/update params={wt=javabin&version=2}{add=[41]} 0 1
   [junit4]   2> 435002 INFO  (qtp15978462-4000) [    ] 
o.a.s.u.p.LogUpdateProcessorFactory [onecollection_local_b_replica1]  
webapp=/solr path=/update 
params={update.distrib=TOLEADER&distrib.from=http://127.0.0.1:34974/solr/onecollection_local_a_replica1/&wt=javabin&version=2}{add=[41]}
 0 0
   [junit4]   2> 435002 INFO  (qtp16203997-4020) [    ] 
o.a.s.u.p.LogUpdateProcessorFactory [onecollection_local_a_replica1]  
webapp=/solr path=/update params={wt=javabin&version=2}{add=[41]} 0 0
   [junit4]   2> 435003 INFO  (qtp16203997-4017) [    ] 
o.a.s.u.p.LogUpdateProcessorFactory [onecollection_b_replica1]  webapp=/solr 
path=/update 
params={update.distrib=TOLEADER&distrib.from=http://127.0.0.1:37090/solr/onecollection_a_replica1/&wt=javabin&version=2}{add=[42
 (1556422632375582720)]} 0 0
   [junit4]   2> 435003 INFO  (qtp15978462-4004) [    ] 
o.a.s.u.p.LogUpdateProcessorFactory [onecollection_a_replica1]  webapp=/solr 
path=/update params={wt=javabin&version=2}{add=[42]} 0 0
   [junit4]   2> 435004 INFO  (qtp15978462-4013) [    ] 
o.a.s.u.p.LogUpdateProcessorFactory [onecollection_local_b_replica1]  
webapp=/solr path=/update 
params={update.distrib=TOLEADER&distrib.from=http://127.0.0.1:34974/solr/onecollection_local_a_replica1/&wt=javabin&version=2}{add=[42]}
 0 0
   [junit4]   2> 435004 INFO  (qtp16203997-4015) [    ] 
o.a.s.u.p.LogUpdateProcessorFactory [onecollection_local_a_replica1]  
webapp=/solr path=/update params={wt=javabin&version=2}{add=[42]} 0 0
   [junit4]   2> 435004 INFO  (qtp16203997-4023) [    ] 
o.a.s.u.p.LogUpdateProcessorFactory [onecollection_b_replica1]  webapp=/solr 
path=/update 
params={update.distrib=TOLEADER&distrib.from=http://127.0.0.1:33485/solr/onecollection_c_replica1/&wt=javabin&version=2}{add=[43
 (1556422632376631296)]} 0 0
   [junit4]   2> 435005 INFO  (qtp2579806-4012) [    ] 
o.a.s.u.p.LogUpdateProcessorFactory [onecollection_c_replica1]  webapp=/solr 
path=/update params={wt=javabin&version=2}{add=[43]} 0 0
   [junit4]   2> 435005 INFO  (qtp15978462-4002) [    ] 
o.a.s.u.p.LogUpdateProcessorFactory [onecollection_local_b_replica1]  
webapp=/solr path=/update 
params={update.distrib=TOLEADER&distrib.from=http://127.0.0.1:33485/solr/onecollection_local_c_replica1/&wt=javabin&version=2}{add=[43]}
 0 0
   [junit4]   2> 435005 INFO  (qtp2579806-4016) [    ] 
o.a.s.u.p.LogUpdateProcessorFactory [onecollection_local_c_replica1]  
webapp=/solr path=/update params={wt=javabin&version=2}{add=[43]} 0 0
   [junit4]   2> 435006 INFO  (qtp16203997-4011) [    ] 
o.a.s.u.p.LogUpdateProcessorFactory [onecollection_b_replica1]  webapp=/solr 
path=/update 
params={update.distrib=TOLEADER&distrib.from=http://127.0.0.1:37090/solr/onecollection_a_replica1/&wt=javabin&version=2}{add=[44
 (1556422632378728448)]} 0 0
   [junit4]   2> 435006 INFO  (qtp15978462-4006) [    ] 
o.a.s.u.p.LogUpdateProcessorFactory [onecollection_a_replica1]  webapp=/solr 
path=/update params={wt=javabin&version=2}{add=[44]} 0 0
   [junit4]   2> 435006 INFO  (qtp15978462-4004) [    ] 
o.a.s.u.p.LogUpdateProcessorFactory [onecollection_local_b_replica1]  
webapp=/solr path=/update params={wt=javabin&version=2}{add=[44]} 0 0
   [junit4]   2> 435007 INFO  (qtp16203997-4024) [    ] 
o.a.s.u.p.LogUpdateProcessorFactory [onecollection_b_replica1]  webapp=/solr 
path=/update params={wt=javabin&version=2}{add=[45 (1556422632379777024)]} 0 0
   [junit4]   2> 435007 INFO  (qtp15978462-4010) [    ] 
o.a.s.u.p.LogUpdateProcessorFactory [onecollection_local_b_replica1]  
webapp=/solr path=/update 
params={update.distrib=TOLEADER&distrib.from=http://127.0.0.1:34974/solr/onecollection_local_a_replica1/&wt=javabin&version=2}{add=[45]}
 0 0
   [junit4]   2> 435008 INFO  (qtp16203997-4015) [    ] 
o.a.s.u.p.LogUpdateProcessorFactory [onecollection_local_a_replica1]  
webapp=/solr path=/update params={wt=javabin&version=2}{add=[45]} 0 0
   [junit4]   2> 435008 INFO  (qtp16203997-4023) [    ] 
o.a.s.u.p.LogUpdateProcessorFactory [onecollection_b_replica1]  webapp=/solr 
path=/update params={wt=javabin&version=2}{add=[46 (1556422632380825600)]} 0 0
   [junit4]   2> 435008 INFO  (qtp15978462-4013) [    ] 
o.a.s.u.p.LogUpdateProcessorFactory [onecollection_local_b_replica1]  
webapp=/solr path=/update params={wt=javabin&version=2}{add=[46]} 0 0
   [junit4]   2> 435009 INFO  (qtp16203997-4017) [    ] 
o.a.s.u.p.LogUpdateProcessorFactory [onecollection_b_replica1]  webapp=/solr 
path=/update 
params={update.distrib=TOLEADER&distrib.from=http://127.0.0.1:37090/solr/onecollection_a_replica1/&wt=javabin&version=2}{add=[47
 (1556422632381874176)]} 0 0
   [junit4]   2> 435010 INFO  (qtp15978462-4006) [    ] 
o.a.s.u.p.LogUpdateProcessorFactory [onecollection_a_replica1]  webapp=/solr 
path=/update params={wt=javabin&version=2}{add=[47]} 0 0
   [junit4]   2> 435010 INFO  (qtp15978462-4002) [    ] 
o.a.s.u.p.LogUpdateProcessorFactory [onecollection_local_b_replica1]  
webapp=/solr path=/update 
params={update.distrib=TOLEADER&distrib.from=http://127.0.0.1:34974/solr/onecollection_local_a_replica1/&wt=javabin&version=2}{add=[47]}
 0 0
   [junit4]   2> 435010 INFO  (qtp16203997-4011) [    ] 
o.a.s.u.p.LogUpdateProcessorFactory [onecollection_local_a_replica1]  
webapp=/solr path=/update params={wt=javabin&version=2}{add=[47]} 0 0
   [junit4]   2> 435011 INFO  (qtp16203997-4020) [    ] 
o.a.s.u.p.LogUpdateProcessorFactory [onecollection_b_replica1]  webapp=/solr 
path=/update 
params={update.distrib=TOLEADER&distrib.from=http://127.0.0.1:33485/solr/onecollection_c_replica1/&wt=javabin&version=2}{add=[48
 (1556422632383971328)]} 0 0
   [junit4]   2> 435011 INFO  (qtp2579806-4003) [    ] 
o.a.s.u.p.LogUpdateProcessorFactory [onecollection_c_replica1]  webapp=/solr 
path=/update params={wt=javabin&version=2}{add=[48]} 0 0
   [jun

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

ue.java:264)
   [junit4]   2>        at 
org.apache.solr.cloud.OverseerTaskProcessor.run(OverseerTaskProcessor.java:162)
   [junit4]   2>        at java.base/java.lang.Thread.run(Thread.java:844)
   [junit4]   2> 
   [junit4]   2> 452286 INFO  (jetty-launcher-739-thread-2) [    ] 
o.a.s.m.SolrMetricManager Closing metric reporters for: solr.node
   [junit4]   2> 452287 INFO  
(OverseerCollectionConfigSetProcessor-97276414634819589-127.0.0.1:42748_solr-n_0000000001)
 [    ] o.a.s.c.OverseerTaskProcessor According to ZK I 
(id=97276414634819589-127.0.0.1:42748_solr-n_0000000001) am no longer a leader.
   [junit4]   2> 452287 INFO  (jetty-launcher-739-thread-2) [    ] 
o.e.j.s.h.ContextHandler Stopped 
o.e.j.s.ServletContextHandler@197fd18{/solr,null,UNAVAILABLE}
   [junit4]   2> 452287 ERROR 
(OverseerHdfsCoreFailoverThread-97276414634819589-127.0.0.1:42748_solr-n_0000000001)
 [    ] o.a.s.c.OverseerAutoReplicaFailoverThread 
OverseerAutoReplicaFailoverThread had an error in its thread work 
loop.:org.apache.solr.common.SolrException: Could not load collection from ZK: 
collection1_local
   [junit4]   2>        at 
org.apache.solr.common.cloud.ZkStateReader.getCollectionLive(ZkStateReader.java:1098)
   [junit4]   2>        at 
org.apache.solr.common.cloud.ZkStateReader$LazyCollectionRef.get(ZkStateReader.java:638)
   [junit4]   2>        at 
org.apache.solr.common.cloud.ClusterState.getCollectionsMap(ClusterState.java:250)
   [junit4]   2>        at 
org.apache.solr.cloud.OverseerAutoReplicaFailoverThread.doWork(OverseerAutoReplicaFailoverThread.java:166)
   [junit4]   2>        at 
org.apache.solr.cloud.OverseerAutoReplicaFailoverThread.run(OverseerAutoReplicaFailoverThread.java:131)
   [junit4]   2>        at java.base/java.lang.Thread.run(Thread.java:844)
   [junit4]   2> Caused by: 
org.apache.zookeeper.KeeperException$SessionExpiredException: KeeperErrorCode = 
Session expired for /collections/collection1_local/state.json
   [junit4]   2>        at 
org.apache.zookeeper.KeeperException.create(KeeperException.java:127)
   [junit4]   2>        at 
org.apache.zookeeper.KeeperException.create(KeeperException.java:51)
   [junit4]   2>        at 
org.apache.zookeeper.ZooKeeper.getData(ZooKeeper.java:1155)
   [junit4]   2>        at 
org.apache.solr.common.cloud.SolrZkClient$7.execute(SolrZkClient.java:356)
   [junit4]   2>        at 
org.apache.solr.common.cloud.SolrZkClient$7.execute(SolrZkClient.java:353)
   [junit4]   2>        at 
org.apache.solr.common.cloud.ZkCmdExecutor.retryOperation(ZkCmdExecutor.java:60)
   [junit4]   2>        at 
org.apache.solr.common.cloud.SolrZkClient.getData(SolrZkClient.java:353)
   [junit4]   2>        at 
org.apache.solr.common.cloud.ZkStateReader.fetchCollectionState(ZkStateReader.java:1110)
   [junit4]   2>        at 
org.apache.solr.common.cloud.ZkStateReader.getCollectionLive(ZkStateReader.java:1096)
   [junit4]   2>        ... 5 more
   [junit4]   2> 
   [junit4]   2> 452288 INFO  
(TEST-TestDistribIDF.testMultiCollectionQuery-seed#[F16DCBA044EEBD8B]) [    ] 
o.a.s.c.ZkTestServer connecting to 127.0.0.1:40896 40896
   [junit4]   2> 452298 INFO  (Thread-1026) [    ] o.a.s.c.ZkTestServer 
connecting to 127.0.0.1:40896 40896
   [junit4]   2> 452299 WARN  (Thread-1026) [    ] o.a.s.c.ZkTestServer Watch 
limit violations: 
   [junit4]   2> Maximum concurrent create/delete watches above limit:
   [junit4]   2> 
   [junit4]   2>        4       /solr/aliases.json
   [junit4]   2>        4       /solr/clusterprops.json
   [junit4]   2>        3       /solr/security.json
   [junit4]   2>        3       /solr/configs/conf2
   [junit4]   2>        2       /solr/configs/conf1
   [junit4]   2> 
   [junit4]   2> Maximum concurrent data watches above limit:
   [junit4]   2> 
   [junit4]   2>        4       /solr/clusterstate.json
   [junit4]   2>        2       /solr/collections/collection2_local/state.json
   [junit4]   2>        2       /solr/collections/collection1_local/state.json
   [junit4]   2>        2       /solr/collections/collection1/state.json
   [junit4]   2>        2       /solr/collections/collection2/state.json
   [junit4]   2> 
   [junit4]   2> Maximum concurrent children watches above limit:
   [junit4]   2> 
   [junit4]   2>        18      /solr/overseer/queue
   [junit4]   2>        8       /solr/overseer/queue-work
   [junit4]   2>        7       /solr/overseer/collection-queue-work
   [junit4]   2>        4       /solr/live_nodes
   [junit4]   2>        4       /solr/collections
   [junit4]   2> 
   [junit4]   2> 452299 INFO  
(TEST-TestDistribIDF.testMultiCollectionQuery-seed#[F16DCBA044EEBD8B]) [    ] 
o.a.s.SolrTestCaseJ4 ###Ending testMultiCollectionQuery
   [junit4]   2> 452300 INFO  
(SUITE-TestDistribIDF-seed#[F16DCBA044EEBD8B]-worker) [    ] 
o.a.s.SolrTestCaseJ4 ###deleteCore
   [junit4]   2> Jan 13, 2017 3:11:47 PM 
com.carrotsearch.randomizedtesting.ThreadLeakControl checkThreadLeaks
   [junit4]   2> WARNING: Will linger awaiting termination of 2 leaked 
thread(s).
   [junit4]   2> Jan 13, 2017 3:12:07 PM 
com.carrotsearch.randomizedtesting.ThreadLeakControl checkThreadLeaks
   [junit4]   2> SEVERE: 1 thread leaked from SUITE scope at 
org.apache.solr.search.stats.TestDistribIDF: 
   [junit4]   2>    1) Thread[id=4306, 
name=OverseerHdfsCoreFailoverThread-97276414634819589-127.0.0.1:42748_solr-n_0000000001,
 state=TIMED_WAITING, group=Overseer Hdfs SolrCore Failover Thread.]
   [junit4]   2>         at java.base/java.lang.Thread.sleep(Native Method)
   [junit4]   2>         at 
org.apache.solr.cloud.OverseerAutoReplicaFailoverThread.run(OverseerAutoReplicaFailoverThread.java:139)
   [junit4]   2>         at java.base/java.lang.Thread.run(Thread.java:844)
   [junit4]   2> Jan 13, 2017 3:12:07 PM 
com.carrotsearch.randomizedtesting.ThreadLeakControl tryToInterruptAll
   [junit4]   2> INFO: Starting to interrupt leaked threads:
   [junit4]   2>    1) Thread[id=4306, 
name=OverseerHdfsCoreFailoverThread-97276414634819589-127.0.0.1:42748_solr-n_0000000001,
 state=TIMED_WAITING, group=Overseer Hdfs SolrCore Failover Thread.]
   [junit4]   2> Jan 13, 2017 3:12:07 PM 
com.carrotsearch.randomizedtesting.ThreadLeakControl tryToInterruptAll
   [junit4]   2> INFO: All leaked threads terminated.
   [junit4]   2> NOTE: test params are: codec=Asserting(Lucene70): 
{range_facet_l_dv=PostingsFormat(name=MockRandom), 
_version_=Lucene50(blocksize=128), multiDefault=PostingsFormat(name=Direct), 
cat=PostingsFormat(name=Direct), intDefault=Lucene50(blocksize=128), 
id=PostingsFormat(name=MockRandom), 
range_facet_i_dv=PostingsFormat(name=Direct), 
_route_=BlockTreeOrds(blocksize=128), 
range_facet_l=PostingsFormat(name=Direct), 
timestamp=PostingsFormat(name=Direct)}, 
docValues:{range_facet_l_dv=DocValuesFormat(name=Lucene70), 
range_facet_i_dv=DocValuesFormat(name=Direct), 
timestamp=DocValuesFormat(name=Direct)}, maxPointsInLeafNode=1732, 
maxMBSortInHeap=6.234814674174203, sim=RandomSimilarity(queryNorm=true): {}, 
locale=ar-LY, timezone=Europe/Oslo
   [junit4]   2> NOTE: Linux 4.4.0-53-generic i386/Oracle Corporation 9-ea 
(32-bit)/cpus=12,threads=1,free=106559080,total=253911040
   [junit4]   2> NOTE: All tests run in this JVM: [MergeStrategyTest, 
VersionInfoTest, TestFastOutputStream, TestCollectionAPI, 
TestMergePolicyConfig, TestRawResponseWriter, RecoveryZkTest, 
DateRangeFieldTest, TestUtils, TestBlendedInfixSuggestions, 
DistributedQueueTest, TestQuerySenderNoQuery, NoCacheHeaderTest, 
TestShardHandlerFactory, TestClassicSimilarityFactory, TestSmileRequest, 
TestShortCircuitedRequests, ResponseHeaderTest, TestDistribDocBasedVersion, 
DistributedQueryComponentCustomSortTest, HdfsSyncSliceTest, 
TestChildDocTransformer, TestCloudPseudoReturnFields, TestRestoreCore, 
TestCSVResponseWriter, TestJsonFacetRefinement, DataDrivenBlockJoinTest, 
TestConfigOverlay, OverseerModifyCollectionTest, 
TestPerFieldSimilarityWithDefaultOverride, ExternalFileFieldSortTest, 
CurrencyFieldXmlFileTest, ConnectionReuseTest, OutputWriterTest, 
PKIAuthenticationIntegrationTest, TestFieldSortValues, 
TestHdfsCloudBackupRestore, DirectUpdateHandlerTest, TestNumericTerms32, 
SolrMetricsIntegrationTest, TestLRUStatsCache, SolrCoreMetricManagerTest, 
TestSort, StatsReloadRaceTest, TestGraphMLResponseWriter, 
TestReversedWildcardFilterFactory, PreAnalyzedFieldTest, 
SolrCoreCheckLockOnStartupTest, RequestLoggingTest, AnalyticsMergeStrategyTest, 
BufferStoreTest, TestSolrDeletionPolicy1, TestRecovery, TestCloudDeleteByQuery, 
DistribCursorPagingTest, TestRTimerTree, TestPHPSerializedResponseWriter, 
SliceStateTest, TestComplexPhraseLeadingWildcard, HdfsUnloadDistributedZkTest, 
CoreAdminHandlerTest, ManagedSchemaRoundRobinCloudTest, TestDocTermOrds, 
HdfsRecoverLeaseTest, OutOfBoxZkACLAndCredentialsProvidersTest, 
SolrJmxReporterTest, TestMaxScoreQueryParser, AssignTest, HLLSerializationTest, 
PrimitiveFieldTypeTest, BlockJoinFacetDistribTest, CollectionStateFormat2Test, 
TlogReplayBufferedWhileIndexingTest, JSONWriterTest, TestSolrXml, 
TestImpersonationWithHadoopAuth, TestTolerantSearch, DeleteInactiveReplicaTest, 
TestSolrFieldCacheMBean, TestOverriddenPrefixQueryForCustomFieldType, 
SolrTestCaseJ4Test, StatsComponentTest, TestDistribIDF]
   [junit4]   2> NOTE: reproduce with: ant test  -Dtestcase=TestDistribIDF 
-Dtests.seed=F16DCBA044EEBD8B -Dtests.multiplier=3 -Dtests.slow=true 
-Dtests.locale=ar-LY -Dtests.timezone=Europe/Oslo -Dtests.asserts=true 
-Dtests.file.encoding=US-ASCII
   [junit4] ERROR   0.00s J2 | TestDistribIDF (suite) <<<
   [junit4]    > Throwable #1: 
com.carrotsearch.randomizedtesting.ThreadLeakError: 1 thread leaked from SUITE 
scope at org.apache.solr.search.stats.TestDistribIDF: 
   [junit4]    >    1) Thread[id=4306, 
name=OverseerHdfsCoreFailoverThread-97276414634819589-127.0.0.1:42748_solr-n_0000000001,
 state=TIMED_WAITING, group=Overseer Hdfs SolrCore Failover Thread.]
   [junit4]    >         at java.base/java.lang.Thread.sleep(Native Method)
   [junit4]    >         at 
org.apache.solr.cloud.OverseerAutoReplicaFailoverThread.run(OverseerAutoReplicaFailoverThread.java:139)
   [junit4]    >         at java.base/java.lang.Thread.run(Thread.java:844)
   [junit4]    >        at 
__randomizedtesting.SeedInfo.seed([F16DCBA044EEBD8B]:0)
   [junit4] Completed [202/678 (1!)] on J2 in 45.19s, 2 tests, 1 error <<< 
FAILURES!

[...truncated 53032 lines...]

---------------------------------------------------------------------
To unsubscribe, e-mail: dev-unsubscr...@lucene.apache.org
For additional commands, e-mail: dev-h...@lucene.apache.org

Reply via email to