Build: https://jenkins.thetaphi.de/job/Lucene-Solr-6.x-Linux/2782/
Java: 32bit/jdk-9-ea+153 -server -XX:+UseSerialGC
2 tests failed.
FAILED: org.apache.solr.cloud.LeaderFailoverAfterPartitionTest.test
Error Message:
Expected 2 of 3 replicas to be active but only found 1;
[core_node3:{"core":"c8n_1x3_lf_shard1_replica3","base_url":"http://127.0.0.1:33963","node_name":"127.0.0.1:33963_","state":"active","leader":"true"}];
clusterState: DocCollection(c8n_1x3_lf//clusterstate.json/34)={
"replicationFactor":"3", "shards":{"shard1":{
"range":"80000000-7fffffff", "state":"active", "replicas":{
"core_node1":{ "core":"c8n_1x3_lf_shard1_replica1",
"base_url":"http://127.0.0.1:33079";, "node_name":"127.0.0.1:33079_",
"state":"down"}, "core_node2":{ "state":"down",
"base_url":"http://127.0.0.1:32962";,
"core":"c8n_1x3_lf_shard1_replica2", "node_name":"127.0.0.1:32962_"},
"core_node3":{ "core":"c8n_1x3_lf_shard1_replica3",
"base_url":"http://127.0.0.1:33963";, "node_name":"127.0.0.1:33963_",
"state":"active", "leader":"true"}}}},
"router":{"name":"compositeId"}, "maxShardsPerNode":"1",
"autoAddReplicas":"false"}
Stack Trace:
java.lang.AssertionError: Expected 2 of 3 replicas to be active but only found
1;
[core_node3:{"core":"c8n_1x3_lf_shard1_replica3","base_url":"http://127.0.0.1:33963","node_name":"127.0.0.1:33963_","state":"active","leader":"true"}];
clusterState: DocCollection(c8n_1x3_lf//clusterstate.json/34)={
"replicationFactor":"3",
"shards":{"shard1":{
"range":"80000000-7fffffff",
"state":"active",
"replicas":{
"core_node1":{
"core":"c8n_1x3_lf_shard1_replica1",
"base_url":"http://127.0.0.1:33079";,
"node_name":"127.0.0.1:33079_",
"state":"down"},
"core_node2":{
"state":"down",
"base_url":"http://127.0.0.1:32962";,
"core":"c8n_1x3_lf_shard1_replica2",
"node_name":"127.0.0.1:32962_"},
"core_node3":{
"core":"c8n_1x3_lf_shard1_replica3",
"base_url":"http://127.0.0.1:33963";,
"node_name":"127.0.0.1:33963_",
"state":"active",
"leader":"true"}}}},
"router":{"name":"compositeId"},
"maxShardsPerNode":"1",
"autoAddReplicas":"false"}
at
__randomizedtesting.SeedInfo.seed([BAAC66F7AAB169E2:32F8592D044D041A]:0)
at org.junit.Assert.fail(Assert.java:93)
at org.junit.Assert.assertTrue(Assert.java:43)
at
org.apache.solr.cloud.LeaderFailoverAfterPartitionTest.testRf3WithLeaderFailover(LeaderFailoverAfterPartitionTest.java:168)
at
org.apache.solr.cloud.LeaderFailoverAfterPartitionTest.test(LeaderFailoverAfterPartitionTest.java:55)
at
java.base/jdk.internal.reflect.NativeMethodAccessorImpl.invoke0(Native Method)
at
java.base/jdk.internal.reflect.NativeMethodAccessorImpl.invoke(NativeMethodAccessorImpl.java:62)
at
java.base/jdk.internal.reflect.DelegatingMethodAccessorImpl.invoke(DelegatingMethodAccessorImpl.java:43)
at java.base/java.lang.reflect.Method.invoke(Method.java:543)
at
com.carrotsearch.randomizedtesting.RandomizedRunner.invoke(RandomizedRunner.java:1713)
at
com.carrotsearch.randomizedtesting.RandomizedRunner$8.evaluate(RandomizedRunner.java:907)
at
com.carrotsearch.randomizedtesting.RandomizedRunner$9.evaluate(RandomizedRunner.java:943)
at
com.carrotsearch.randomizedtesting.RandomizedRunner$10.evaluate(RandomizedRunner.java:957)
at
org.apache.solr.BaseDistributedSearchTestCase$ShardsRepeatRule$ShardsFixedStatement.callStatement(BaseDistributedSearchTestCase.java:992)
at
org.apache.solr.BaseDistributedSearchTestCase$ShardsRepeatRule$ShardsStatement.evaluate(BaseDistributedSearchTestCase.java:967)
at
com.carrotsearch.randomizedtesting.rules.SystemPropertiesRestoreRule$1.evaluate(SystemPropertiesRestoreRule.java:57)
at
org.apache.lucene.util.TestRuleSetupTeardownChained$1.evaluate(TestRuleSetupTeardownChained.java:49)
at
org.apache.lucene.util.AbstractBeforeAfterRule$1.evaluate(AbstractBeforeAfterRule.java:45)
at
org.apache.lucene.util.TestRuleThreadAndTestName$1.evaluate(TestRuleThreadAndTestName.java:48)
at
org.apache.lucene.util.TestRuleIgnoreAfterMaxFailures$1.evaluate(TestRuleIgnoreAfterMaxFailures.java:64)
at
org.apache.lucene.util.TestRuleMarkFailure$1.evaluate(TestRuleMarkFailure.java:47)
at
com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
at
com.carrotsearch.randomizedtesting.ThreadLeakControl$StatementRunner.run(ThreadLeakControl.java:368)
at
com.carrotsearch.randomizedtesting.ThreadLeakControl.forkTimeoutingTask(ThreadLeakControl.java:817)
at
com.carrotsearch.randomizedtesting.ThreadLeakControl$3.evaluate(ThreadLeakControl.java:468)
at
com.carrotsearch.randomizedtesting.RandomizedRunner.runSingleTest(RandomizedRunner.java:916)
at
com.carrotsearch.randomizedtesting.RandomizedRunner$5.evaluate(RandomizedRunner.java:802)
at
com.carrotsearch.randomizedtesting.RandomizedRunner$6.evaluate(RandomizedRunner.java:852)
at
com.carrotsearch.randomizedtesting.RandomizedRunner$7.evaluate(RandomizedRunner.java:863)
at
com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
at
com.carrotsearch.randomizedtesting.rules.SystemPropertiesRestoreRule$1.evaluate(SystemPropertiesRestoreRule.java:57)
at
org.apache.lucene.util.AbstractBeforeAfterRule$1.evaluate(AbstractBeforeAfterRule.java:45)
at
com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
at
org.apache.lucene.util.TestRuleStoreClassName$1.evaluate(TestRuleStoreClassName.java:41)
at
com.carrotsearch.randomizedtesting.rules.NoShadowingOrOverridesOnMethodsRule$1.evaluate(NoShadowingOrOverridesOnMethodsRule.java:40)
at
com.carrotsearch.randomizedtesting.rules.NoShadowingOrOverridesOnMethodsRule$1.evaluate(NoShadowingOrOverridesOnMethodsRule.java:40)
at
com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
at
com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
at
org.apache.lucene.util.TestRuleAssertionsRequired$1.evaluate(TestRuleAssertionsRequired.java:53)
at
org.apache.lucene.util.TestRuleMarkFailure$1.evaluate(TestRuleMarkFailure.java:47)
at
org.apache.lucene.util.TestRuleIgnoreAfterMaxFailures$1.evaluate(TestRuleIgnoreAfterMaxFailures.java:64)
at
org.apache.lucene.util.TestRuleIgnoreTestSuites$1.evaluate(TestRuleIgnoreTestSuites.java:54)
at
com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
at
com.carrotsearch.randomizedtesting.ThreadLeakControl$StatementRunner.run(ThreadLeakControl.java:368)
at java.base/java.lang.Thread.run(Thread.java:844)
FAILED: org.apache.solr.handler.admin.MBeansHandlerTest.testDiff
Error Message:
expected:<Was: [1, Now: 2], Delta: 1> but was:<Was: [4, Now: 5], Delta: 1>
Stack Trace:
org.junit.ComparisonFailure: expected:<Was: [1, Now: 2], Delta: 1> but
was:<Was: [4, Now: 5], Delta: 1>
at
__randomizedtesting.SeedInfo.seed([BAAC66F7AAB169E2:7FBAA26CBA075182]:0)
at org.junit.Assert.assertEquals(Assert.java:125)
at org.junit.Assert.assertEquals(Assert.java:147)
at
org.apache.solr.handler.admin.MBeansHandlerTest.testDiff(MBeansHandlerTest.java:63)
at
java.base/jdk.internal.reflect.NativeMethodAccessorImpl.invoke0(Native Method)
at
java.base/jdk.internal.reflect.NativeMethodAccessorImpl.invoke(NativeMethodAccessorImpl.java:62)
at
java.base/jdk.internal.reflect.DelegatingMethodAccessorImpl.invoke(DelegatingMethodAccessorImpl.java:43)
at java.base/java.lang.reflect.Method.invoke(Method.java:543)
at
com.carrotsearch.randomizedtesting.RandomizedRunner.invoke(RandomizedRunner.java:1713)
at
com.carrotsearch.randomizedtesting.RandomizedRunner$8.evaluate(RandomizedRunner.java:907)
at
com.carrotsearch.randomizedtesting.RandomizedRunner$9.evaluate(RandomizedRunner.java:943)
at
com.carrotsearch.randomizedtesting.RandomizedRunner$10.evaluate(RandomizedRunner.java:957)
at
com.carrotsearch.randomizedtesting.rules.SystemPropertiesRestoreRule$1.evaluate(SystemPropertiesRestoreRule.java:57)
at
org.apache.lucene.util.TestRuleSetupTeardownChained$1.evaluate(TestRuleSetupTeardownChained.java:49)
at
org.apache.lucene.util.AbstractBeforeAfterRule$1.evaluate(AbstractBeforeAfterRule.java:45)
at
org.apache.lucene.util.TestRuleThreadAndTestName$1.evaluate(TestRuleThreadAndTestName.java:48)
at
org.apache.lucene.util.TestRuleIgnoreAfterMaxFailures$1.evaluate(TestRuleIgnoreAfterMaxFailures.java:64)
at
org.apache.lucene.util.TestRuleMarkFailure$1.evaluate(TestRuleMarkFailure.java:47)
at
com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
at
com.carrotsearch.randomizedtesting.ThreadLeakControl$StatementRunner.run(ThreadLeakControl.java:368)
at
com.carrotsearch.randomizedtesting.ThreadLeakControl.forkTimeoutingTask(ThreadLeakControl.java:817)
at
com.carrotsearch.randomizedtesting.ThreadLeakControl$3.evaluate(ThreadLeakControl.java:468)
at
com.carrotsearch.randomizedtesting.RandomizedRunner.runSingleTest(RandomizedRunner.java:916)
at
com.carrotsearch.randomizedtesting.RandomizedRunner$5.evaluate(RandomizedRunner.java:802)
at
com.carrotsearch.randomizedtesting.RandomizedRunner$6.evaluate(RandomizedRunner.java:852)
at
com.carrotsearch.randomizedtesting.RandomizedRunner$7.evaluate(RandomizedRunner.java:863)
at
com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
at
com.carrotsearch.randomizedtesting.rules.SystemPropertiesRestoreRule$1.evaluate(SystemPropertiesRestoreRule.java:57)
at
org.apache.lucene.util.AbstractBeforeAfterRule$1.evaluate(AbstractBeforeAfterRule.java:45)
at
com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
at
org.apache.lucene.util.TestRuleStoreClassName$1.evaluate(TestRuleStoreClassName.java:41)
at
com.carrotsearch.randomizedtesting.rules.NoShadowingOrOverridesOnMethodsRule$1.evaluate(NoShadowingOrOverridesOnMethodsRule.java:40)
at
com.carrotsearch.randomizedtesting.rules.NoShadowingOrOverridesOnMethodsRule$1.evaluate(NoShadowingOrOverridesOnMethodsRule.java:40)
at
com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
at
com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
at
org.apache.lucene.util.TestRuleAssertionsRequired$1.evaluate(TestRuleAssertionsRequired.java:53)
at
org.apache.lucene.util.TestRuleMarkFailure$1.evaluate(TestRuleMarkFailure.java:47)
at
org.apache.lucene.util.TestRuleIgnoreAfterMaxFailures$1.evaluate(TestRuleIgnoreAfterMaxFailures.java:64)
at
org.apache.lucene.util.TestRuleIgnoreTestSuites$1.evaluate(TestRuleIgnoreTestSuites.java:54)
at
com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
at
com.carrotsearch.randomizedtesting.ThreadLeakControl$StatementRunner.run(ThreadLeakControl.java:368)
at java.base/java.lang.Thread.run(Thread.java:844)
Build Log:
[...truncated 10954 lines...]
[junit4] Suite: org.apache.solr.cloud.LeaderFailoverAfterPartitionTest
[junit4] 2> Creating dataDir:
/home/jenkins/workspace/Lucene-Solr-6.x-Linux/solr/build/solr-core/test/J2/temp/solr.cloud.LeaderFailoverAfterPartitionTest_BAAC66F7AAB169E2-001/init-core-data-001
[junit4] 2> 29049 INFO
(SUITE-LeaderFailoverAfterPartitionTest-seed#[BAAC66F7AAB169E2]-worker) [ ]
o.a.s.SolrTestCaseJ4 Randomized ssl (false) and clientAuth (false) via:
@org.apache.solr.SolrTestCaseJ4$SuppressSSL(bugUrl="https://issues.apache.org/jira/browse/SOLR-5776";)
[junit4] 2> 29050 INFO
(SUITE-LeaderFailoverAfterPartitionTest-seed#[BAAC66F7AAB169E2]-worker) [ ]
o.a.s.BaseDistributedSearchTestCase Setting hostContext system property: /
[junit4] 2> 29053 INFO
(TEST-LeaderFailoverAfterPartitionTest.test-seed#[BAAC66F7AAB169E2]) [ ]
o.a.s.c.ZkTestServer STARTING ZK TEST SERVER
[junit4] 2> 29053 INFO (Thread-78) [ ] o.a.s.c.ZkTestServer client
port:0.0.0.0/0.0.0.0:0
[junit4] 2> 29053 INFO (Thread-78) [ ] o.a.s.c.ZkTestServer Starting
server
[junit4] 2> 29153 INFO
(TEST-LeaderFailoverAfterPartitionTest.test-seed#[BAAC66F7AAB169E2]) [ ]
o.a.s.c.ZkTestServer start zk server on port:42991
[junit4] 2> 29166 INFO
(TEST-LeaderFailoverAfterPartitionTest.test-seed#[BAAC66F7AAB169E2]) [ ]
o.a.s.c.AbstractZkTestCase put
/home/jenkins/workspace/Lucene-Solr-6.x-Linux/solr/core/src/test-files/solr/collection1/conf/solrconfig-tlog.xml
to /configs/conf1/solrconfig.xml
[junit4] 2> 29169 INFO
(TEST-LeaderFailoverAfterPartitionTest.test-seed#[BAAC66F7AAB169E2]) [ ]
o.a.s.c.AbstractZkTestCase put
/home/jenkins/workspace/Lucene-Solr-6.x-Linux/solr/core/src/test-files/solr/collection1/conf/schema.xml
to /configs/conf1/schema.xml
[junit4] 2> 29173 INFO
(TEST-LeaderFailoverAfterPartitionTest.test-seed#[BAAC66F7AAB169E2]) [ ]
o.a.s.c.AbstractZkTestCase put
/home/jenkins/workspace/Lucene-Solr-6.x-Linux/solr/core/src/test-files/solr/collection1/conf/solrconfig.snippet.randomindexconfig.xml
to /configs/conf1/solrconfig.snippet.randomindexconfig.xml
[junit4] 2> 29175 INFO
(TEST-LeaderFailoverAfterPartitionTest.test-seed#[BAAC66F7AAB169E2]) [ ]
o.a.s.c.AbstractZkTestCase put
/home/jenkins/workspace/Lucene-Solr-6.x-Linux/solr/core/src/test-files/solr/collection1/conf/stopwords.txt
to /configs/conf1/stopwords.txt
[junit4] 2> 29177 INFO
(TEST-LeaderFailoverAfterPartitionTest.test-seed#[BAAC66F7AAB169E2]) [ ]
o.a.s.c.AbstractZkTestCase put
/home/jenkins/workspace/Lucene-Solr-6.x-Linux/solr/core/src/test-files/solr/collection1/conf/protwords.txt
to /configs/conf1/protwords.txt
[junit4] 2> 29179 INFO
(TEST-LeaderFailoverAfterPartitionTest.test-seed#[BAAC66F7AAB169E2]) [ ]
o.a.s.c.AbstractZkTestCase put
/home/jenkins/workspace/Lucene-Solr-6.x-Linux/solr/core/src/test-files/solr/collection1/conf/currency.xml
to /configs/conf1/currency.xml
[junit4] 2> 29181 INFO
(TEST-LeaderFailoverAfterPartitionTest.test-seed#[BAAC66F7AAB169E2]) [ ]
o.a.s.c.AbstractZkTestCase put
/home/jenkins/workspace/Lucene-Solr-6.x-Linux/solr/core/src/test-files/solr/collection1/conf/enumsConfig.xml
to /configs/conf1/enumsConfig.xml
[junit4] 2> 29183 INFO
(TEST-LeaderFailoverAfterPartitionTest.test-seed#[BAAC66F7AAB169E2]) [ ]
o.a.s.c.AbstractZkTestCase put
/home/jenkins/workspace/Lucene-Solr-6.x-Linux/solr/core/src/test-files/solr/collection1/conf/open-exchange-rates.json
to /configs/conf1/open-exchange-rates.json
[junit4] 2> 29186 INFO
(TEST-LeaderFailoverAfterPartitionTest.test-seed#[BAAC66F7AAB169E2]) [ ]
o.a.s.c.AbstractZkTestCase put
/home/jenkins/workspace/Lucene-Solr-6.x-Linux/solr/core/src/test-files/solr/collection1/conf/mapping-ISOLatin1Accent.txt
to /configs/conf1/mapping-ISOLatin1Accent.txt
[junit4] 2> 29188 INFO
(TEST-LeaderFailoverAfterPartitionTest.test-seed#[BAAC66F7AAB169E2]) [ ]
o.a.s.c.AbstractZkTestCase put
/home/jenkins/workspace/Lucene-Solr-6.x-Linux/solr/core/src/test-files/solr/collection1/conf/old_synonyms.txt
to /configs/conf1/old_synonyms.txt
[junit4] 2> 29191 INFO
(TEST-LeaderFailoverAfterPartitionTest.test-seed#[BAAC66F7AAB169E2]) [ ]
o.a.s.c.AbstractZkTestCase put
/home/jenkins/workspace/Lucene-Solr-6.x-Linux/solr/core/src/test-files/solr/collection1/conf/synonyms.txt
to /configs/conf1/synonyms.txt
[junit4] 2> 29727 INFO
(TEST-LeaderFailoverAfterPartitionTest.test-seed#[BAAC66F7AAB169E2]) [ ]
o.a.s.SolrTestCaseJ4 Writing core.properties file to
/home/jenkins/workspace/Lucene-Solr-6.x-Linux/solr/build/solr-core/test/J2/temp/solr.cloud.LeaderFailoverAfterPartitionTest_BAAC66F7AAB169E2-001/control-001/cores/collection1
[junit4] 2> 29730 INFO
(TEST-LeaderFailoverAfterPartitionTest.test-seed#[BAAC66F7AAB169E2]) [ ]
o.e.j.s.Server jetty-9.3.14.v20161028
[junit4] 2> 29731 INFO
(TEST-LeaderFailoverAfterPartitionTest.test-seed#[BAAC66F7AAB169E2]) [ ]
o.e.j.s.h.ContextHandler Started
o.e.j.s.ServletContextHandler@fa3d3{/,null,AVAILABLE}
[junit4] 2> 29733 INFO
(TEST-LeaderFailoverAfterPartitionTest.test-seed#[BAAC66F7AAB169E2]) [ ]
o.e.j.s.AbstractConnector Started
ServerConnector@558171{HTTP/1.1,[http/1.1]}{127.0.0.1:36758}
[junit4] 2> 29733 INFO
(TEST-LeaderFailoverAfterPartitionTest.test-seed#[BAAC66F7AAB169E2]) [ ]
o.e.j.s.Server Started @31910ms
[junit4] 2> 29733 INFO
(TEST-LeaderFailoverAfterPartitionTest.test-seed#[BAAC66F7AAB169E2]) [ ]
o.a.s.c.s.e.JettySolrRunner Jetty properties: {hostContext=/,
solr.data.dir=/home/jenkins/workspace/Lucene-Solr-6.x-Linux/solr/build/solr-core/test/J2/temp/solr.cloud.LeaderFailoverAfterPartitionTest_BAAC66F7AAB169E2-001/tempDir-001/control/data,
hostPort=32962,
coreRootDirectory=/home/jenkins/workspace/Lucene-Solr-6.x-Linux/solr/build/solr-core/test/J2/temp/solr.cloud.LeaderFailoverAfterPartitionTest_BAAC66F7AAB169E2-001/control-001/cores}
[junit4] 2> 29733 ERROR
(TEST-LeaderFailoverAfterPartitionTest.test-seed#[BAAC66F7AAB169E2]) [ ]
o.a.s.s.StartupLoggingUtils Missing Java Option solr.log.dir. Logging may be
missing or incomplete.
[junit4] 2> 29733 INFO
(TEST-LeaderFailoverAfterPartitionTest.test-seed#[BAAC66F7AAB169E2]) [ ]
o.a.s.s.SolrDispatchFilter ___ _ Welcome to Apache Solr? version
6.5.0
[junit4] 2> 29733 INFO
(TEST-LeaderFailoverAfterPartitionTest.test-seed#[BAAC66F7AAB169E2]) [ ]
o.a.s.s.SolrDispatchFilter / __| ___| |_ _ Starting in cloud mode on port null
[junit4] 2> 29733 INFO
(TEST-LeaderFailoverAfterPartitionTest.test-seed#[BAAC66F7AAB169E2]) [ ]
o.a.s.s.SolrDispatchFilter \__ \/ _ \ | '_| Install dir: null
[junit4] 2> 29733 INFO
(TEST-LeaderFailoverAfterPartitionTest.test-seed#[BAAC66F7AAB169E2]) [ ]
o.a.s.s.SolrDispatchFilter |___/\___/_|_| Start time:
2017-02-02T05:37:44.677680Z
[junit4] 2> 29736 INFO
(TEST-LeaderFailoverAfterPartitionTest.test-seed#[BAAC66F7AAB169E2]) [ ]
o.a.s.s.SolrDispatchFilter Loading solr.xml from SolrHome (not found in
ZooKeeper)
[junit4] 2> 29736 INFO
(TEST-LeaderFailoverAfterPartitionTest.test-seed#[BAAC66F7AAB169E2]) [ ]
o.a.s.c.SolrXmlConfig Loading container configuration from
/home/jenkins/workspace/Lucene-Solr-6.x-Linux/solr/build/solr-core/test/J2/temp/solr.cloud.LeaderFailoverAfterPartitionTest_BAAC66F7AAB169E2-001/control-001/solr.xml
[junit4] 2> 29749 INFO
(TEST-LeaderFailoverAfterPartitionTest.test-seed#[BAAC66F7AAB169E2]) [ ]
o.a.s.u.UpdateShardHandler Creating UpdateShardHandler HTTP client with params:
socketTimeout=340000&connTimeout=45000&retry=true
[junit4] 2> 29752 INFO
(TEST-LeaderFailoverAfterPartitionTest.test-seed#[BAAC66F7AAB169E2]) [ ]
o.a.s.c.ZkContainer Zookeeper client=127.0.0.1:42991/solr
[junit4] 2> 29767 INFO
(TEST-LeaderFailoverAfterPartitionTest.test-seed#[BAAC66F7AAB169E2]) [ ]
o.a.s.c.OverseerElectionContext I am going to be the leader 127.0.0.1:32962_
[junit4] 2> 29768 INFO
(TEST-LeaderFailoverAfterPartitionTest.test-seed#[BAAC66F7AAB169E2]) [ ]
o.a.s.c.Overseer Overseer (id=97387404591038468-127.0.0.1:32962_-n_0000000000)
starting
[junit4] 2> 29774 INFO
(TEST-LeaderFailoverAfterPartitionTest.test-seed#[BAAC66F7AAB169E2]) [ ]
o.a.s.c.ZkController Register node as live in
ZooKeeper:/live_nodes/127.0.0.1:32962_
[junit4] 2> 29777 INFO (zkCallback-73-thread-1) [ ]
o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (0) -> (1)
[junit4] 2> 29947 INFO
(TEST-LeaderFailoverAfterPartitionTest.test-seed#[BAAC66F7AAB169E2]) [ ]
o.a.s.c.CorePropertiesLocator Found 1 core definitions underneath
/home/jenkins/workspace/Lucene-Solr-6.x-Linux/solr/build/solr-core/test/J2/temp/solr.cloud.LeaderFailoverAfterPartitionTest_BAAC66F7AAB169E2-001/control-001/cores
[junit4] 2> 29947 INFO
(TEST-LeaderFailoverAfterPartitionTest.test-seed#[BAAC66F7AAB169E2]) [ ]
o.a.s.c.CorePropertiesLocator Cores are: [collection1]
[junit4] 2> 29950 INFO
(OverseerStateUpdate-97387404591038468-127.0.0.1:32962_-n_0000000000) [ ]
o.a.s.c.o.ReplicaMutator Assigning new node to shard shard=shard1
[junit4] 2> 30961 INFO (coreLoadExecutor-222-thread-1) [ ]
o.a.s.c.SolrConfig Using Lucene MatchVersion: 6.5.0
[junit4] 2> 30989 INFO (coreLoadExecutor-222-thread-1) [ ]
o.a.s.s.IndexSchema [collection1] Schema name=test
[junit4] 2> 31079 WARN (coreLoadExecutor-222-thread-1) [ ]
o.a.s.s.IndexSchema [collection1] default search field in schema is text.
WARNING: Deprecated, please use 'df' on request instead.
[junit4] 2> 31081 INFO (coreLoadExecutor-222-thread-1) [ ]
o.a.s.s.IndexSchema Loaded schema test/1.0 with uniqueid field id
[junit4] 2> 31092 INFO (coreLoadExecutor-222-thread-1) [ ]
o.a.s.c.CoreContainer Creating SolrCore 'collection1' using configuration from
collection control_collection
[junit4] 2> 31093 INFO (coreLoadExecutor-222-thread-1) [ ]
o.a.s.c.SolrCore [[collection1] ] Opening new SolrCore at
[/home/jenkins/workspace/Lucene-Solr-6.x-Linux/solr/build/solr-core/test/J2/temp/solr.cloud.LeaderFailoverAfterPartitionTest_BAAC66F7AAB169E2-001/control-001/cores/collection1],
dataDir=[/home/jenkins/workspace/Lucene-Solr-6.x-Linux/solr/build/solr-core/test/J2/temp/solr.cloud.LeaderFailoverAfterPartitionTest_BAAC66F7AAB169E2-001/control-001/cores/collection1/data/]
[junit4] 2> 31093 INFO (coreLoadExecutor-222-thread-1) [ ]
o.a.s.c.JmxMonitoredMap JMX monitoring is enabled. Adding Solr mbeans to JMX
Server: com.sun.jmx.mbeanserver.JmxMBeanServer@239cb7
[junit4] 2> 31094 INFO (coreLoadExecutor-222-thread-1) [ ]
o.a.s.u.RandomMergePolicy RandomMergePolicy wrapping class
org.apache.lucene.index.LogDocMergePolicy: [LogDocMergePolicy:
minMergeSize=1000, mergeFactor=41, maxMergeSize=9223372036854775807,
maxMergeSizeForForcedMerge=9223372036854775807, calibrateSizeByDeletes=true,
maxMergeDocs=2147483647, maxCFSSegmentSizeMB=8.796093022207999E12,
noCFSRatio=0.5913324068191124]
[junit4] 2> 31103 WARN (coreLoadExecutor-222-thread-1) [ ]
o.a.s.c.RequestHandlers INVALID paramSet a in requestHandler {type =
requestHandler,name = /dump,class = DumpRequestHandler,attributes =
{initParams=a, name=/dump, class=DumpRequestHandler},args =
{defaults={a=A,b=B}}}
[junit4] 2> 31117 INFO (coreLoadExecutor-222-thread-1) [ ]
o.a.s.u.UpdateHandler Using UpdateLog implementation:
org.apache.solr.update.UpdateLog
[junit4] 2> 31117 INFO (coreLoadExecutor-222-thread-1) [ ]
o.a.s.u.UpdateLog Initializing UpdateLog: dataDir= defaultSyncLevel=FLUSH
numRecordsToKeep=100 maxNumLogsToKeep=10 numVersionBuckets=65536
[junit4] 2> 31119 INFO (coreLoadExecutor-222-thread-1) [ ]
o.a.s.u.CommitTracker Hard AutoCommit: disabled
[junit4] 2> 31119 INFO (coreLoadExecutor-222-thread-1) [ ]
o.a.s.u.CommitTracker Soft AutoCommit: disabled
[junit4] 2> 31120 INFO (coreLoadExecutor-222-thread-1) [ ]
o.a.s.u.RandomMergePolicy RandomMergePolicy wrapping class
org.apache.lucene.index.LogByteSizeMergePolicy: [LogByteSizeMergePolicy:
minMergeSize=1677721, mergeFactor=32, maxMergeSize=2147483648,
maxMergeSizeForForcedMerge=9223372036854775807, calibrateSizeByDeletes=false,
maxMergeDocs=2147483647, maxCFSSegmentSizeMB=8.796093022207999E12,
noCFSRatio=0.0]
[junit4] 2> 31121 INFO (coreLoadExecutor-222-thread-1) [ ]
o.a.s.s.SolrIndexSearcher Opening [Searcher@d99220[collection1] main]
[junit4] 2> 31122 INFO (coreLoadExecutor-222-thread-1) [ ]
o.a.s.r.ManagedResourceStorage Configured ZooKeeperStorageIO with znodeBase:
/configs/conf1
[junit4] 2> 31122 INFO (coreLoadExecutor-222-thread-1) [ ]
o.a.s.r.ManagedResourceStorage Loaded null at path _rest_managed.json using
ZooKeeperStorageIO:path=/configs/conf1
[junit4] 2> 31122 INFO (coreLoadExecutor-222-thread-1) [ ]
o.a.s.h.ReplicationHandler Commits will be reserved for 10000
[junit4] 2> 31124 INFO (searcherExecutor-223-thread-1) [ ]
o.a.s.c.SolrCore [collection1] Registered new searcher
Searcher@d99220[collection1]
main{ExitableDirectoryReader(UninvertingDirectoryReader())}
[junit4] 2> 31124 INFO (coreLoadExecutor-222-thread-1) [ ]
o.a.s.u.UpdateLog Could not find max version in index or recent updates, using
new clock 1558198475626119168
[junit4] 2> 31131 INFO (coreZkRegister-215-thread-1) [ ]
o.a.s.c.ShardLeaderElectionContext Enough replicas found to continue.
[junit4] 2> 31131 INFO (coreZkRegister-215-thread-1) [ ]
o.a.s.c.ShardLeaderElectionContext I may be the new leader - try and sync
[junit4] 2> 31132 INFO (coreZkRegister-215-thread-1) [ ]
o.a.s.c.SyncStrategy Sync replicas to http://127.0.0.1:32962/collection1/
[junit4] 2> 31132 INFO (coreZkRegister-215-thread-1) [ ]
o.a.s.c.SyncStrategy Sync Success - now sync replicas to me
[junit4] 2> 31132 INFO (coreZkRegister-215-thread-1) [ ]
o.a.s.c.SyncStrategy http://127.0.0.1:32962/collection1/ has no replicas
[junit4] 2> 31135 INFO (coreZkRegister-215-thread-1) [ ]
o.a.s.c.ShardLeaderElectionContext I am the new leader:
http://127.0.0.1:32962/collection1/ shard1
[junit4] 2> 31286 INFO (coreZkRegister-215-thread-1) [ ]
o.a.s.c.ZkController I am the leader, no recovery necessary
[junit4] 2> 31515 INFO
(TEST-LeaderFailoverAfterPartitionTest.test-seed#[BAAC66F7AAB169E2]) [ ]
o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (0) -> (1)
[junit4] 2> 31516 INFO
(TEST-LeaderFailoverAfterPartitionTest.test-seed#[BAAC66F7AAB169E2]) [ ]
o.a.s.c.s.i.ZkClientClusterStateProvider Cluster at 127.0.0.1:42991/solr ready
[junit4] 2> 31517 INFO
(TEST-LeaderFailoverAfterPartitionTest.test-seed#[BAAC66F7AAB169E2]) [ ]
o.a.s.c.ChaosMonkey monkey: init - expire sessions:false cause connection
loss:false
[junit4] 2> 32140 INFO
(TEST-LeaderFailoverAfterPartitionTest.test-seed#[BAAC66F7AAB169E2]) [ ]
o.a.s.SolrTestCaseJ4 Writing core.properties file to
/home/jenkins/workspace/Lucene-Solr-6.x-Linux/solr/build/solr-core/test/J2/temp/solr.cloud.LeaderFailoverAfterPartitionTest_BAAC66F7AAB169E2-001/shard-1-001/cores/collection1
[junit4] 2> 32140 INFO
(TEST-LeaderFailoverAfterPartitionTest.test-seed#[BAAC66F7AAB169E2]) [ ]
o.a.s.c.AbstractFullDistribZkTestBase create jetty 1 in directory
/home/jenkins/workspace/Lucene-Solr-6.x-Linux/solr/build/solr-core/test/J2/temp/solr.cloud.LeaderFailoverAfterPartitionTest_BAAC66F7AAB169E2-001/shard-1-001
[junit4] 2> 32141 INFO
(TEST-LeaderFailoverAfterPartitionTest.test-seed#[BAAC66F7AAB169E2]) [ ]
o.e.j.s.Server jetty-9.3.14.v20161028
[junit4] 2> 32142 INFO
(TEST-LeaderFailoverAfterPartitionTest.test-seed#[BAAC66F7AAB169E2]) [ ]
o.e.j.s.h.ContextHandler Started
o.e.j.s.ServletContextHandler@158ecf0{/,null,AVAILABLE}
[junit4] 2> 32142 INFO
(TEST-LeaderFailoverAfterPartitionTest.test-seed#[BAAC66F7AAB169E2]) [ ]
o.e.j.s.AbstractConnector Started
ServerConnector@1b001a7{HTTP/1.1,[http/1.1]}{127.0.0.1:45223}
[junit4] 2> 32143 INFO
(TEST-LeaderFailoverAfterPartitionTest.test-seed#[BAAC66F7AAB169E2]) [ ]
o.e.j.s.Server Started @34320ms
[junit4] 2> 32143 INFO
(TEST-LeaderFailoverAfterPartitionTest.test-seed#[BAAC66F7AAB169E2]) [ ]
o.a.s.c.s.e.JettySolrRunner Jetty properties: {hostContext=/,
solrconfig=solrconfig.xml,
solr.data.dir=/home/jenkins/workspace/Lucene-Solr-6.x-Linux/solr/build/solr-core/test/J2/temp/solr.cloud.LeaderFailoverAfterPartitionTest_BAAC66F7AAB169E2-001/tempDir-001/jetty1,
hostPort=38728,
coreRootDirectory=/home/jenkins/workspace/Lucene-Solr-6.x-Linux/solr/build/solr-core/test/J2/temp/solr.cloud.LeaderFailoverAfterPartitionTest_BAAC66F7AAB169E2-001/shard-1-001/cores}
[junit4] 2> 32143 ERROR
(TEST-LeaderFailoverAfterPartitionTest.test-seed#[BAAC66F7AAB169E2]) [ ]
o.a.s.s.StartupLoggingUtils Missing Java Option solr.log.dir. Logging may be
missing or incomplete.
[junit4] 2> 32143 INFO
(TEST-LeaderFailoverAfterPartitionTest.test-seed#[BAAC66F7AAB169E2]) [ ]
o.a.s.s.SolrDispatchFilter ___ _ Welcome to Apache Solr? version
6.5.0
[junit4] 2> 32143 INFO
(TEST-LeaderFailoverAfterPartitionTest.test-seed#[BAAC66F7AAB169E2]) [ ]
o.a.s.s.SolrDispatchFilter / __| ___| |_ _ Starting in cloud mode on port null
[junit4] 2> 32143 INFO
(TEST-LeaderFailoverAfterPartitionTest.test-seed#[BAAC66F7AAB169E2]) [ ]
o.a.s.s.SolrDispatchFilter \__ \/ _ \ | '_| Install dir: null
[junit4] 2> 32143 INFO
(TEST-LeaderFailoverAfterPartitionTest.test-seed#[BAAC66F7AAB169E2]) [ ]
o.a.s.s.SolrDispatchFilter |___/\___/_|_| Start time:
2017-02-02T05:37:47.087599Z
[junit4] 2> 32146 INFO
(TEST-LeaderFailoverAfterPartitionTest.test-seed#[BAAC66F7AAB169E2]) [ ]
o.a.s.s.SolrDispatchFilter Loading solr.xml from SolrHome (not found in
ZooKeeper)
[junit4] 2> 32146 INFO
(TEST-LeaderFailoverAfterPartitionTest.test-seed#[BAAC66F7AAB169E2]) [ ]
o.a.s.c.SolrXmlConfig Loading container configuration from
/home/jenkins/workspace/Lucene-Solr-6.x-Linux/solr/build/solr-core/test/J2/temp/solr.cloud.LeaderFailoverAfterPartitionTest_BAAC66F7AAB169E2-001/shard-1-001/solr.xml
[junit4] 2> 32153 INFO
(TEST-LeaderFailoverAfterPartitionTest.test-seed#[BAAC66F7AAB169E2]) [ ]
o.a.s.u.UpdateShardHandler Creating UpdateShardHandler HTTP client with params:
socketTimeout=340000&connTimeout=45000&retry=true
[junit4] 2> 32155 INFO
(TEST-LeaderFailoverAfterPartitionTest.test-seed#[BAAC66F7AAB169E2]) [ ]
o.a.s.c.ZkContainer Zookeeper client=127.0.0.1:42991/solr
[junit4] 2> 32162 INFO
(TEST-LeaderFailoverAfterPartitionTest.test-seed#[BAAC66F7AAB169E2]) [ ]
o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (0) -> (1)
[junit4] 2> 32165 INFO
(TEST-LeaderFailoverAfterPartitionTest.test-seed#[BAAC66F7AAB169E2]) [ ]
o.a.s.c.ZkController Register node as live in
ZooKeeper:/live_nodes/127.0.0.1:38728_
[junit4] 2> 32166 INFO (zkCallback-82-thread-1) [ ]
o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (1) -> (2)
[junit4] 2> 32166 INFO (zkCallback-73-thread-2) [ ]
o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (1) -> (2)
[junit4] 2> 32167 INFO (zkCallback-77-thread-1) [ ]
o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (1) -> (2)
[junit4] 2> 32308 INFO
(TEST-LeaderFailoverAfterPartitionTest.test-seed#[BAAC66F7AAB169E2]) [ ]
o.a.s.c.CorePropertiesLocator Found 1 core definitions underneath
/home/jenkins/workspace/Lucene-Solr-6.x-Linux/solr/build/solr-core/test/J2/temp/solr.cloud.LeaderFailoverAfterPartitionTest_BAAC66F7AAB169E2-001/shard-1-001/cores
[junit4] 2> 32308 INFO
(TEST-LeaderFailoverAfterPartitionTest.test-seed#[BAAC66F7AAB169E2]) [ ]
o.a.s.c.CorePropertiesLocator Cores are: [collection1]
[junit4] 2> 32310 INFO
(OverseerStateUpdate-97387404591038468-127.0.0.1:32962_-n_0000000000) [ ]
o.a.s.c.o.ReplicaMutator Assigning new node to shard shard=shard2
[junit4] 2> 33324 INFO (coreLoadExecutor-233-thread-1) [ ]
o.a.s.c.SolrConfig Using Lucene MatchVersion: 6.5.0
[junit4] 2> 33338 INFO (coreLoadExecutor-233-thread-1) [ ]
o.a.s.s.IndexSchema [collection1] Schema name=test
[junit4] 2> 33428 WARN (coreLoadExecutor-233-thread-1) [ ]
o.a.s.s.IndexSchema [collection1] default search field in schema is text.
WARNING: Deprecated, please use 'df' on request instead.
[junit4] 2> 33431 INFO (coreLoadExecutor-233-thread-1) [ ]
o.a.s.s.IndexSchema Loaded schema test/1.0 with uniqueid field id
[junit4] 2> 33451 INFO (coreLoadExecutor-233-thread-1) [ ]
o.a.s.c.CoreContainer Creating SolrCore 'collection1' using configuration from
collection collection1
[junit4] 2> 33452 INFO (coreLoadExecutor-233-thread-1) [ ]
o.a.s.c.SolrCore [[collection1] ] Opening new SolrCore at
[/home/jenkins/workspace/Lucene-Solr-6.x-Linux/solr/build/solr-core/test/J2/temp/solr.cloud.LeaderFailoverAfterPartitionTest_BAAC66F7AAB169E2-001/shard-1-001/cores/collection1],
dataDir=[/home/jenkins/workspace/Lucene-Solr-6.x-Linux/solr/build/solr-core/test/J2/temp/solr.cloud.LeaderFailoverAfterPartitionTest_BAAC66F7AAB169E2-001/shard-1-001/cores/collection1/data/]
[junit4] 2> 33452 INFO (coreLoadExecutor-233-thread-1) [ ]
o.a.s.c.JmxMonitoredMap JMX monitoring is enabled. Adding Solr mbeans to JMX
Server: com.sun.jmx.mbeanserver.JmxMBeanServer@239cb7
[junit4] 2> 33454 INFO (coreLoadExecutor-233-thread-1) [ ]
o.a.s.u.RandomMergePolicy RandomMergePolicy wrapping class
org.apache.lucene.index.LogDocMergePolicy: [LogDocMergePolicy:
minMergeSize=1000, mergeFactor=41, maxMergeSize=9223372036854775807,
maxMergeSizeForForcedMerge=9223372036854775807, calibrateSizeByDeletes=true,
maxMergeDocs=2147483647, maxCFSSegmentSizeMB=8.796093022207999E12,
noCFSRatio=0.5913324068191124]
[junit4] 2> 33460 WARN (coreLoadExecutor-233-thread-1) [ ]
o.a.s.c.RequestHandlers INVALID paramSet a in requestHandler {type =
requestHandler,name = /dump,class = DumpRequestHandler,attributes =
{initParams=a, name=/dump, class=DumpRequestHandler},args =
{defaults={a=A,b=B}}}
[junit4] 2> 33475 INFO (coreLoadExecutor-233-thread-1) [ ]
o.a.s.u.UpdateHandler Using UpdateLog implementation:
org.apache.solr.update.UpdateLog
[junit4] 2> 33475 INFO (coreLoadExecutor-233-thread-1) [ ]
o.a.s.u.UpdateLog Initializing UpdateLog: dataDir= defaultSyncLevel=FLUSH
numRecordsToKeep=100 maxNumLogsToKeep=10 numVersionBuckets=65536
[junit4] 2> 33477 INFO (coreLoadExecutor-233-thread-1) [ ]
o.a.s.u.CommitTracker Hard AutoCommit: disabled
[junit4] 2> 33477 INFO (coreLoadExecutor-233-thread-1) [ ]
o.a.s.u.CommitTracker Soft AutoCommit: disabled
[junit4] 2> 33477 INFO (coreLoadExecutor-233-thread-1) [ ]
o.a.s.u.RandomMergePolicy RandomMergePolicy wrapping class
org.apache.lucene.index.LogByteSizeMergePolicy: [LogByteSizeMergePolicy:
minMergeSize=1677721, mergeFactor=32, maxMergeSize=2147483648,
maxMergeSizeForForcedMerge=9223372036854775807, calibrateSizeByDeletes=false,
maxMergeDocs=2147483647, maxCFSSegmentSizeMB=8.796093022207999E12,
noCFSRatio=0.0]
[junit4] 2> 33478 INFO (coreLoadExecutor-233-thread-1) [ ]
o.a.s.s.SolrIndexSearcher Opening [Searcher@72cf53[collection1] main]
[junit4] 2> 33479 INFO (coreLoadExecutor-233-thread-1) [ ]
o.a.s.r.ManagedResourceStorage Configured ZooKeeperStorageIO with znodeBase:
/configs/conf1
[junit4] 2> 33479 INFO (coreLoadExecutor-233-thread-1) [ ]
o.a.s.r.ManagedResourceStorage Loaded null at path _rest_managed.json using
ZooKeeperStorageIO:path=/configs/conf1
[junit4] 2> 33480 INFO (coreLoadExecutor-233-thread-1) [ ]
o.a.s.h.ReplicationHandler Commits will be reserved for 10000
[junit4] 2> 33481 INFO (searcherExecutor-234-thread-1) [ ]
o.a.s.c.SolrCore [collection1] Registered new searcher
Searcher@72cf53[collection1]
main{ExitableDirectoryReader(UninvertingDirectoryReader())}
[junit4] 2> 33482 INFO (coreLoadExecutor-233-thread-1) [ ]
o.a.s.u.UpdateLog Could not find max version in index or recent updates, using
new clock 1558198478098661376
[junit4] 2> 33486 INFO (coreZkRegister-228-thread-1) [ ]
o.a.s.c.ShardLeaderElectionContext Enough replicas found to continue.
[junit4] 2> 33487 INFO (coreZkRegister-228-thread-1) [ ]
o.a.s.c.ShardLeaderElectionContext I may be the new leader - try and sync
[junit4] 2> 33487 INFO (coreZkRegister-228-thread-1) [ ]
o.a.s.c.SyncStrategy Sync replicas to http://127.0.0.1:38728/collection1/
[junit4] 2> 33487 INFO (coreZkRegister-228-thread-1) [ ]
o.a.s.c.SyncStrategy Sync Success - now sync replicas to me
[junit4] 2> 33487 INFO (coreZkRegister-228-thread-1) [ ]
o.a.s.c.SyncStrategy http://127.0.0.1:38728/collection1/ has no replicas
[junit4] 2> 33489 INFO (coreZkRegister-228-thread-1) [ ]
o.a.s.c.ShardLeaderElectionContext I am the new leader:
http://127.0.0.1:38728/collection1/ shard2
[junit4] 2> 33640 INFO (coreZkRegister-228-thread-1) [ ]
o.a.s.c.ZkController I am the leader, no recovery necessary
[junit4] 2> 34468 INFO
(TEST-LeaderFailoverAfterPartitionTest.test-seed#[BAAC66F7AAB169E2]) [ ]
o.a.s.SolrTestCaseJ4 Writing core.properties file to
/home/jenkins/workspace/Lucene-Solr-6.x-Linux/solr/build/solr-core/test/J2/temp/solr.cloud.LeaderFailoverAfterPartitionTest_BAAC66F7AAB169E2-001/shard-2-001/cores/collection1
[junit4] 2> 34468 INFO
(TEST-LeaderFailoverAfterPartitionTest.test-seed#[BAAC66F7AAB169E2]) [ ]
o.a.s.c.AbstractFullDistribZkTestBase create jetty 2 in directory
/home/jenkins/workspace/Lucene-Solr-6.x-Linux/solr/build/solr-core/test/J2/temp/solr.cloud.LeaderFailoverAfterPartitionTest_BAAC66F7AAB169E2-001/shard-2-001
[junit4] 2> 34469 INFO
(TEST-LeaderFailoverAfterPartitionTest.test-seed#[BAAC66F7AAB169E2]) [ ]
o.e.j.s.Server jetty-9.3.14.v20161028
[junit4] 2> 34473 INFO
(TEST-LeaderFailoverAfterPartitionTest.test-seed#[BAAC66F7AAB169E2]) [ ]
o.e.j.s.h.ContextHandler Started
o.e.j.s.ServletContextHandler@18a50f{/,null,AVAILABLE}
[junit4] 2> 34473 INFO
(TEST-LeaderFailoverAfterPartitionTest.test-seed#[BAAC66F7AAB169E2]) [ ]
o.e.j.s.AbstractConnector Started
ServerConnector@1b3ee85{HTTP/1.1,[http/1.1]}{127.0.0.1:45354}
[junit4] 2> 34474 INFO
(TEST-LeaderFailoverAfterPartitionTest.test-seed#[BAAC66F7AAB169E2]) [ ]
o.e.j.s.Server Started @36651ms
[junit4] 2> 34474 INFO
(TEST-LeaderFailoverAfterPartitionTest.test-seed#[BAAC66F7AAB169E2]) [ ]
o.a.s.c.s.e.JettySolrRunner Jetty properties: {hostContext=/,
solrconfig=solrconfig.xml,
solr.data.dir=/home/jenkins/workspace/Lucene-Solr-6.x-Linux/solr/build/solr-core/test/J2/temp/solr.cloud.LeaderFailoverAfterPartitionTest_BAAC66F7AAB169E2-001/tempDir-001/jetty2,
hostPort=33079,
coreRootDirectory=/home/jenkins/workspace/Lucene-Solr-6.x-Linux/solr/build/solr-core/test/J2/temp/solr.cloud.LeaderFailoverAfterPartitionTest_BAAC66F7AAB169E2-001/shard-2-001/cores}
[junit4] 2> 34474 ERROR
(TEST-LeaderFailoverAfterPartitionTest.test-seed#[BAAC66F7AAB169E2]) [ ]
o.a.s.s.StartupLoggingUtils Missing Java Option solr.log.dir. Logging may be
missing or incomplete.
[junit4] 2> 34474 INFO
(TEST-LeaderFailoverAfterPartitionTest.test-seed#[BAAC66F7AAB169E2]) [ ]
o.a.s.s.SolrDispatchFilter ___ _ Welcome to Apache Solr? version
6.5.0
[junit4] 2> 34474 INFO
(TEST-LeaderFailoverAfterPartitionTest.test-seed#[BAAC66F7AAB169E2]) [ ]
o.a.s.s.SolrDispatchFilter / __| ___| |_ _ Starting in cloud mode on port null
[junit4] 2> 34474 INFO
(TEST-LeaderFailoverAfterPartitionTest.test-seed#[BAAC66F7AAB169E2]) [ ]
o.a.s.s.SolrDispatchFilter \__ \/ _ \ | '_| Install dir: null
[junit4] 2> 34474 INFO
(TEST-LeaderFailoverAfterPartitionTest.test-seed#[BAAC66F7AAB169E2]) [ ]
o.a.s.s.SolrDispatchFilter |___/\___/_|_| Start time:
2017-02-02T05:37:49.418698Z
[junit4] 2> 34478 INFO
(TEST-LeaderFailoverAfterPartitionTest.test-seed#[BAAC66F7AAB169E2]) [ ]
o.a.s.s.SolrDispatchFilter Loading solr.xml from SolrHome (not found in
ZooKeeper)
[junit4] 2> 34478 INFO
(TEST-LeaderFailoverAfterPartitionTest.test-seed#[BAAC66F7AAB169E2]) [ ]
o.a.s.c.SolrXmlConfig Loading container configuration from
/home/jenkins/workspace/Lucene-Solr-6.x-Linux/solr/build/solr-core/test/J2/temp/solr.cloud.LeaderFailoverAfterPartitionTest_BAAC66F7AAB169E2-001/shard-2-001/solr.xml
[junit4] 2> 34484 INFO
(TEST-LeaderFailoverAfterPartitionTest.test-seed#[BAAC66F7AAB169E2]) [ ]
o.a.s.u.UpdateShardHandler Creating UpdateShardHandler HTTP client with params:
socketTimeout=340000&connTimeout=45000&retry=true
[junit4] 2> 34486 INFO
(TEST-LeaderFailoverAfterPartitionTest.test-seed#[BAAC66F7AAB169E2]) [ ]
o.a.s.c.ZkContainer Zookeeper client=127.0.0.1:42991/solr
[junit4] 2> 34494 INFO
(TEST-LeaderFailoverAfterPartitionTest.test-seed#[BAAC66F7AAB169E2]) [ ]
o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (0) -> (2)
[junit4] 2> 34496 INFO
(TEST-LeaderFailoverAfterPartitionTest.test-seed#[BAAC66F7AAB169E2]) [ ]
o.a.s.c.ZkController Register node as live in
ZooKeeper:/live_nodes/127.0.0.1:33079_
[junit4] 2> 34497 INFO (zkCallback-77-thread-1) [ ]
o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (2) -> (3)
[junit4] 2> 34498 INFO (zkCallback-82-thread-1) [ ]
o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (2) -> (3)
[junit4] 2> 34498 INFO (zkCallback-73-thread-2) [ ]
o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (2) -> (3)
[junit4] 2> 34498 INFO (zkCallback-88-thread-1) [ ]
o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (2) -> (3)
[junit4] 2> 34786 INFO
(TEST-LeaderFailoverAfterPartitionTest.test-seed#[BAAC66F7AAB169E2]) [ ]
o.a.s.c.CorePropertiesLocator Found 1 core definitions underneath
/home/jenkins/workspace/Lucene-Solr-6.x-Linux/solr/build/solr-core/test/J2/temp/solr.cloud.LeaderFailoverAfterPartitionTest_BAAC66F7AAB169E2-001/shard-2-001/cores
[junit4] 2> 34786 INFO
(TEST-LeaderFailoverAfterPartitionTest.test-seed#[BAAC66F7AAB169E2]) [ ]
o.a.s.c.CorePropertiesLocator Cores are: [collection1]
[junit4] 2> 34796 INFO
(OverseerStateUpdate-97387404591038468-127.0.0.1:32962_-n_0000000000) [ ]
o.a.s.c.o.ReplicaMutator Assigning new node to shard shard=shard1
[junit4] 2> 35804 INFO (coreLoadExecutor-244-thread-1) [ ]
o.a.s.c.SolrConfig Using Lucene MatchVersion: 6.5.0
[junit4] 2> 35820 INFO (coreLoadExecutor-244-thread-1) [ ]
o.a.s.s.IndexSchema [collection1] Schema name=test
[junit4] 2> 35920 WARN (coreLoadExecutor-244-thread-1) [ ]
o.a.s.s.IndexSchema [collection1] default search field in schema is text.
WARNING: Deprecated, please use 'df' on request instead.
[junit4] 2> 35922 INFO (coreLoadExecutor-244-thread-1) [ ]
o.a.s.s.IndexSchema Loaded schema test/1.0 with uniqueid field id
[junit4] 2> 35936 INFO (coreLoadExecutor-244-thread-1) [ ]
o.a.s.c.CoreContainer Creating SolrCore 'collection1' using configuration from
collection collection1
[junit4] 2> 35937 INFO (coreLoadExecutor-244-thread-1) [ ]
o.a.s.c.SolrCore [[collection1] ] Opening new SolrCore at
[/home/jenkins/workspace/Lucene-Solr-6.x-Linux/solr/build/solr-core/test/J2/temp/solr.cloud.LeaderFailoverAfterPartitionTest_BAAC66F7AAB169E2-001/shard-2-001/cores/collection1],
dataDir=[/home/jenkins/workspace/Lucene-Solr-6.x-Linux/solr/build/solr-core/test/J2/temp/solr.cloud.LeaderFailoverAfterPartitionTest_BAAC66F7AAB169E2-001/shard-2-001/cores/collection1/data/]
[junit4] 2> 35937 INFO (coreLoadExecutor-244-thread-1) [ ]
o.a.s.c.JmxMonitoredMap JMX monitoring is enabled. Adding Solr mbeans to JMX
Server: com.sun.jmx.mbeanserver.JmxMBeanServer@239cb7
[junit4] 2> 35939 INFO (coreLoadExecutor-244-thread-1) [ ]
o.a.s.u.RandomMergePolicy RandomMergePolicy wrapping class
org.apache.lucene.index.LogDocMergePolicy: [LogDocMergePolicy:
minMergeSize=1000, mergeFactor=41, maxMergeSize=9223372036854775807,
maxMergeSizeForForcedMerge=9223372036854775807, calibrateSizeByDeletes=true,
maxMergeDocs=2147483647, maxCFSSegmentSizeMB=8.796093022207999E12,
noCFSRatio=0.5913324068191124]
[junit4] 2> 35948 WARN (coreLoadExecutor-244-thread-1) [ ]
o.a.s.c.RequestHandlers INVALID paramSet a in requestHandler {type =
requestHandler,name = /dump,class = DumpRequestHandler,attributes =
{initParams=a, name=/dump, class=DumpRequestHandler},args =
{defaults={a=A,b=B}}}
[junit4] 2> 35973 INFO (coreLoadExecutor-244-thread-1) [ ]
o.a.s.u.UpdateHandler Using UpdateLog implementation:
org.apache.solr.update.UpdateLog
[junit4] 2> 35973 INFO (coreLoadExecutor-244-thread-1) [ ]
o.a.s.u.UpdateLog Initializing UpdateLog: dataDir= defaultSyncLevel=FLUSH
numRecordsToKeep=100 maxNumLogsToKeep=10 numVersionBuckets=65536
[junit4] 2> 35975 INFO (coreLoadExecutor-244-thread-1) [ ]
o.a.s.u.CommitTracker Hard AutoCommit: disabled
[junit4] 2> 35975 INFO (coreLoadExecutor-244-thread-1) [ ]
o.a.s.u.CommitTracker Soft AutoCommit: disabled
[junit4] 2> 35977 INFO (coreLoadExecutor-244-thread-1) [ ]
o.a.s.u.RandomMergePolicy RandomMergePolicy wrapping class
org.apache.lucene.index.LogByteSizeMergePolicy: [LogByteSizeMergePolicy:
minMergeSize=1677721, mergeFactor=32, maxMergeSize=2147483648,
maxMergeSizeForForcedMerge=9223372036854775807, calibrateSizeByDeletes=false,
maxMergeDocs=2147483647, maxCFSSegmentSizeMB=8.796093022207999E12,
noCFSRatio=0.0]
[junit4] 2> 35978 INFO (coreLoadExecutor-244-thread-1) [ ]
o.a.s.s.SolrIndexSearcher Opening [Searcher@5cbd3f[collection1] main]
[junit4] 2> 35978 INFO (coreLoadExecutor-244-thread-1) [ ]
o.a.s.r.ManagedResourceStorage Configured ZooKeeperStorageIO with znodeBase:
/configs/conf1
[junit4] 2> 35979 INFO (coreLoadExecutor-244-thread-1) [ ]
o.a.s.r.ManagedResourceStorage Loaded null at path _rest_managed.json using
ZooKeeperStorageIO:path=/configs/conf1
[junit4] 2> 35979 INFO (coreLoadExecutor-244-thread-1) [ ]
o.a.s.h.ReplicationHandler Commits will be reserved for 10000
[junit4] 2> 35981 INFO (searcherExecutor-245-thread-1) [ ]
o.a.s.c.SolrCore [collection1] Registered new searcher
Searcher@5cbd3f[collection1]
main{ExitableDirectoryReader(UninvertingDirectoryReader())}
[junit4] 2> 35982 INFO (coreLoadExecutor-244-thread-1) [ ]
o.a.s.u.UpdateLog Could not find max version in index or recent updates, using
new clock 1558198480720101376
[junit4] 2> 35989 INFO (coreZkRegister-239-thread-1) [ ]
o.a.s.c.ShardLeaderElectionContext Enough replicas found to continue.
[junit4] 2> 35989 INFO (coreZkRegister-239-thread-1) [ ]
o.a.s.c.ShardLeaderElectionContext I may be the new leader - try and sync
[junit4] 2> 35989 INFO (coreZkRegister-239-thread-1) [ ]
o.a.s.c.SyncStrategy Sync replicas to http://127.0.0.1:33079/collection1/
[junit4] 2> 35989 INFO (coreZkRegister-239-thread-1) [ ]
o.a.s.c.SyncStrategy Sync Success - now sync replicas to me
[junit4] 2> 35989 INFO (coreZkRegister-239-thread-1) [ ]
o.a.s.c.SyncStrategy http://127.0.0.1:33079/collection1/ has no replicas
[junit4] 2> 35992 INFO (coreZkRegister-239-thread-1) [ ]
o.a.s.c.ShardLeaderElectionContext I am the new leader:
http://127.0.0.1:33079/collection1/ shard1
[junit4] 2> 36143 INFO (coreZkRegister-239-thread-1) [ ]
o.a.s.c.ZkController I am the leader, no recovery necessary
[junit4] 2> 37050 INFO
(TEST-LeaderFailoverAfterPartitionTest.test-seed#[BAAC66F7AAB169E2]) [ ]
o.a.s.SolrTestCaseJ4 Writing core.properties file to
/home/jenkins/workspace/Lucene-Solr-6.x-Linux/solr/build/solr-core/test/J2/temp/solr.cloud.LeaderFailoverAfterPartitionTest_BAAC66F7AAB169E2-001/shard-3-001/cores/collection1
[junit4] 2> 37050 INFO
(TEST-LeaderFailoverAfterPartitionTest.test-seed#[BAAC66F7AAB169E2]) [ ]
o.a.s.c.AbstractFullDistribZkTestBase create jetty 3 in directory
/home/jenkins/workspace/Lucene-Solr-6.x-Linux/solr/build/solr-core/test/J2/temp/solr.cloud.LeaderFailoverAfterPartitionTest_BAAC66F7AAB169E2-001/shard-3-001
[junit4] 2> 37051 INFO
(TEST-LeaderFailoverAfterPartitionTest.test-seed#[BAAC66F7AAB169E2]) [ ]
o.e.j.s.Server jetty-9.3.14.v20161028
[junit4] 2> 37053 INFO
(TEST-LeaderFailoverAfterPartitionTest.test-seed#[BAAC66F7AAB169E2]) [ ]
o.e.j.s.h.ContextHandler Started
o.e.j.s.ServletContextHandler@1b2b2d0{/,null,AVAILABLE}
[junit4] 2> 37053 INFO
(TEST-LeaderFailoverAfterPartitionTest.test-seed#[BAAC66F7AAB169E2]) [ ]
o.e.j.s.AbstractConnector Started
ServerConnector@1b6b5ed{HTTP/1.1,[http/1.1]}{127.0.0.1:40102}
[junit4] 2> 37053 INFO
(TEST-LeaderFailoverAfterPartitionTest.test-seed#[BAAC66F7AAB169E2]) [ ]
o.e.j.s.Server Started @39231ms
[junit4] 2> 37054 INFO
(TEST-LeaderFailoverAfterPartitionTest.test-seed#[BAAC66F7AAB169E2]) [ ]
o.a.s.c.s.e.JettySolrRunner Jetty properties: {hostContext=/,
solrconfig=solrconfig.xml,
solr.data.dir=/home/jenkins/workspace/Lucene-Solr-6.x-Linux/solr/build/solr-core/test/J2/temp/solr.cloud.LeaderFailoverAfterPartitionTest_BAAC66F7AAB169E2-001/tempDir-001/jetty3,
hostPort=33963,
coreRootDirectory=/home/jenkins/workspace/Lucene-Solr-6.x-Linux/solr/build/solr-core/test/J2/temp/solr.cloud.LeaderFailoverAfterPartitionTest_BAAC66F7AAB169E2-001/shard-3-001/cores}
[junit4] 2> 37054 ERROR
(TEST-LeaderFailoverAfterPartitionTest.test-seed#[BAAC66F7AAB169E2]) [ ]
o.a.s.s.StartupLoggingUtils Missing Java Option solr.log.dir. Logging may be
missing or incomplete.
[junit4] 2> 37054 INFO
(TEST-LeaderFailoverAfterPartitionTest.test-seed#[BAAC66F7AAB169E2]) [ ]
o.a.s.s.SolrDispatchFilter ___ _ Welcome to Apache Solr? version
6.5.0
[junit4] 2> 37054 INFO
(TEST-LeaderFailoverAfterPartitionTest.test-seed#[BAAC66F7AAB169E2]) [ ]
o.a.s.s.SolrDispatchFilter / __| ___| |_ _ Starting in cloud mode on port null
[junit4] 2> 37054 INFO
(TEST-LeaderFailoverAfterPartitionTest.test-seed#[BAAC66F7AAB169E2]) [ ]
o.a.s.s.SolrDispatchFilter \__ \/ _ \ | '_| Install dir: null
[junit4] 2> 37054 INFO
(TEST-LeaderFailoverAfterPartitionTest.test-seed#[BAAC66F7AAB169E2]) [ ]
o.a.s.s.SolrDispatchFilter |___/\___/_|_| Start time:
2017-02-02T05:37:51.998745Z
[junit4] 2> 37059 INFO
(TEST-LeaderFailoverAfterPartitionTest.test-seed#[BAAC66F7AAB169E2]) [ ]
o.a.s.s.SolrDispatchFilter Loading solr.xml from SolrHome (not found in
ZooKeeper)
[junit4] 2> 37059 INFO
(TEST-LeaderFailoverAfterPartitionTest.test-seed#[BAAC66F7AAB169E2]) [ ]
o.a.s.c.SolrXmlConfig Loading container configuration from
/home/jenkins/workspace/Lucene-Solr-6.x-Linux/solr/build/solr-core/test/J2/temp/solr.cloud.LeaderFailoverAfterPartitionTest_BAAC66F7AAB169E2-001/shard-3-001/solr.xml
[junit4] 2> 37073 INFO
(TEST-LeaderFailoverAfterPartitionTest.test-seed#[BAAC66F7AAB169E2]) [ ]
o.a.s.u.UpdateShardHandler Creating UpdateShardHandler HTTP client with params:
socketTimeout=340000&connTimeout=45000&retry=true
[junit4] 2> 37075 INFO
(TEST-LeaderFailoverAfterPartitionTest.test-seed#[BAAC66F7AAB169E2]) [ ]
o.a.s.c.ZkContainer Zookeeper client=127.0.0.1:42991/solr
[junit4] 2> 37091 INFO
(TEST-LeaderFailoverAfterPartitionTest.test-seed#[BAAC66F7AAB169E2]) [ ]
o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (0) -> (3)
[junit4] 2> 37098 INFO
(TEST-LeaderFailoverAfterPartitionTest.test-seed#[BAAC66F7AAB169E2]) [ ]
o.a.s.c.ZkController Register node as live in
ZooKeeper:/live_nodes/127.0.0.1:33963_
[junit4] 2> 37099 INFO (zkCallback-77-thread-1) [ ]
o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (3) -> (4)
[junit4] 2> 37099 INFO (zkCallback-88-thread-1) [ ]
o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (3) -> (4)
[junit4] 2> 37100 INFO (zkCallback-82-thread-1) [ ]
o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (3) -> (4)
[junit4] 2> 37100 INFO (zkCallback-73-thread-2) [ ]
o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (3) -> (4)
[junit4] 2> 37100 INFO (zkCallback-94-thread-1) [ ]
o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (3) -> (4)
[junit4] 2> 37226 INFO
(TEST-LeaderFailoverAfterPartitionTest.test-seed#[BAAC66F7AAB169E2]) [ ]
o.a.s.c.CorePropertiesLocator Found 1 core definitions underneath
/home/jenkins/workspace/Lucene-Solr-6.x-Linux/solr/build/solr-core/test/J2/temp/solr.cloud.LeaderFailoverAfterPartitionTest_BAAC66F7AAB169E2-001/shard-3-001/cores
[junit4] 2> 37226 INFO
(TEST-LeaderFailoverAfterPartitionTest.test-seed#[BAAC66F7AAB169E2]) [ ]
o.a.s.c.CorePropertiesLocator Cores are: [collection1]
[junit4] 2> 37228 INFO
(OverseerStateUpdate-97387404591038468-127.0.0.1:32962_-n_0000000000) [ ]
o.a.s.c.o.ReplicaMutator Assigning new node to shard shard=shard2
[junit4] 2> 38242 INFO (coreLoadExecutor-255-thread-1) [ ]
o.a.s.c.SolrConfig Using Lucene MatchVersion: 6.5.0
[junit4] 2> 38256 INFO (coreLoadExecutor-255-thread-1) [ ]
o.a.s.s.IndexSchema [collection1] Schema name=test
[junit4] 2> 38334 WARN (coreLoadExecutor-255-thread-1) [ ]
o.a.s.s.IndexSchema [collection1] default search field in schema is text.
WARNING: Deprecated, please use 'df' on request instead.
[junit4] 2> 38336 INFO (coreLoadExecutor-255-thread-1) [ ]
o.a.s.s.IndexSchema Loaded schema test/1.0 with uniqueid field id
[junit4] 2> 38345 INFO (coreLoadExecutor-255-thread-1) [ ]
o.a.s.c.CoreContainer Creating SolrCore 'collection1' using configuration from
collection collection1
[junit4] 2> 38346 INFO (coreLoadExecutor-255-thread-1) [ ]
o.a.s.c.SolrCore [[collection1] ] Opening new SolrCore at
[/home/jenkins/workspace/Lucene-Solr-6.x-Linux/solr/build/solr-core/test/J2/temp/solr.cloud.LeaderFailoverAfterPartitionTest_BAAC66F7AAB169E2-001/shard-3-001/cores/collection1],
dataDir=[/home/jenkins/workspace/Lucene-Solr-6.x-Linux/solr/build/solr-core/test/J2/temp/solr.cloud.LeaderFailoverAfterPartitionTest_BAAC66F7AAB169E2-001/shard-3-001/cores/collection1/data/]
[junit4] 2> 38346 INFO (coreLoadExecutor-255-thread-1) [ ]
o.a.s.c.JmxMonitoredMap JMX monitoring is enabled. Adding Solr mbeans to JMX
Server: com.sun.jmx.mbeanserver.JmxMBeanServer@239cb7
[junit4] 2> 38347 INFO (coreLoadExecutor-255-thread-1) [ ]
o.a.s.u.RandomMergePolicy RandomMergePolicy wrapping class
org.apache.lucene.index.LogDocMergePolicy: [LogDocMergePolicy:
minMergeSize=1000, mergeFactor=41, maxMergeSize=9223372036854775807,
maxMergeSizeForForcedMerge=9223372036854775807, calibrateSizeByDeletes=true,
maxMergeDocs=2147483647, maxCFSSegmentSizeMB=8.796093022207999E12,
noCFSRatio=0.5913324068191124]
[junit4] 2> 38353 WARN (coreLoadExecutor-255-thread-1) [ ]
o.a.s.c.RequestHandlers INVALID paramSet a in requestHandler {type =
requestHandler,name = /dump,class = DumpRequestHandler,attributes =
{initParams=a, name=/dump, class=DumpRequestHandler},args =
{defaults={a=A,b=B}}}
[junit4] 2> 38364 INFO (coreLoadExecutor-255-thread-1) [ ]
o.a.s.u.UpdateHandler Using UpdateLog implementation:
org.apache.solr.update.UpdateLog
[junit4] 2> 38364 INFO (coreLoadExecutor-255-thread-1) [ ]
o.a.s.u.UpdateLog Initializing UpdateLog: dataDir= defaultSyncLevel=FLUSH
numRecordsToKeep=100 maxNumLogsToKeep=10 numVersionBuckets=65536
[junit4] 2> 38365 INFO (coreLoadExecutor-255-thread-1) [ ]
o.a.s.u.CommitTracker Hard AutoCommit: disabled
[junit4] 2> 38365 INFO (coreLoadExecutor-255-thread-1) [ ]
o.a.s.u.CommitTracker Soft AutoCommit: disabled
[junit4] 2> 38366 INFO (coreLoadExecutor-255-thread-1) [ ]
o.a.s.u.RandomMergePolicy RandomMergePolicy wrapping class
org.apache.lucene.index.LogByteSizeMergePolicy: [LogByteSizeMergePolicy:
minMergeSize=1677721, mergeFactor=32, maxMergeSize=2147483648,
maxMergeSizeForForcedMerge=9223372036854775807, calibrateSizeByDeletes=false,
maxMergeDocs=2147483647, maxCFSSegmentSizeMB=8.796093022207999E12,
noCFSRatio=0.0]
[junit4] 2> 38366 INFO (coreLoadExecutor-255-thread-1) [ ]
o.a.s.s.SolrIndexSearcher Opening [Searcher@1bd733a[collection1] main]
[junit4] 2> 38367 INFO (coreLoadExecutor-255-thread-1) [ ]
o.a.s.r.ManagedResourceStorage Configured ZooKeeperStorageIO with znodeBase:
/configs/conf1
[junit4] 2> 38367 INFO (coreLoadExecutor-255-thread-1) [ ]
o.a.s.r.ManagedResourceStorage Loaded null at path _rest_managed.json using
ZooKeeperStorageIO:path=/configs/conf1
[junit4] 2> 38367 INFO (coreLoadExecutor-255-thread-1) [ ]
o.a.s.h.ReplicationHandler Commits will be reserved for 10000
[junit4] 2> 38369 INFO (searcherExecutor-256-thread-1) [ ]
o.a.s.c.SolrCore [collection1] Registered new searcher
Searcher@1bd733a[collection1]
main{ExitableDirectoryReader(UninvertingDirectoryReader())}
[junit4] 2> 38369 INFO (coreLoadExecutor-255-thread-1) [ ]
o.a.s.u.UpdateLog Could not find max version in index or recent updates, using
new clock 1558198483223052288
[junit4] 2> 38372 INFO (coreZkRegister-250-thread-1) [ ]
o.a.s.c.ZkController Core needs to recover:collection1
[junit4] 2> 38373 INFO (updateExecutor-91-thread-1) [ ]
o.a.s.u.DefaultSolrCoreState Running recovery
[junit4] 2> 38376 INFO (recoveryExecutor-92-thread-1) [ ]
o.a.s.c.RecoveryStrategy Starting recovery process. recoveringAfterStartup=true
[junit4] 2> 38376 INFO (recoveryExecutor-92-thread-1) [ ]
o.a.s.c.RecoveryStrategy ###### startupVersions=[[]]
[junit4] 2> 38376 INFO (recoveryExecutor-92-thread-1) [ ]
o.a.s.c.RecoveryStrategy Begin buffering updates. core=[collection1]
[junit4] 2> 38377 INFO (recoveryExecutor-92-thread-1) [ ]
o.a.s.u.UpdateLog Starting to buffer updates. FSUpdateLog{state=ACTIVE,
tlog=null}
[junit4] 2> 38377 INFO (recoveryExecutor-92-thread-1) [ ]
o.a.s.c.RecoveryStrategy Publishing state of core [collection1] as recovering,
leader is [http://127.0.0.1:38728/collection1/] and I am
[http://127.0.0.1:33963/collection1/]
[junit4] 2> 38380 INFO (recoveryExecutor-92-thread-1) [ ]
o.a.s.c.RecoveryStrategy Sending prep recovery command to
[http://127.0.0.1:38728]; [WaitForState:
action=PREPRECOVERY&core=collection1&nodeName=127.0.0.1:33963_&coreNodeName=core_node3&state=recovering&checkLive=true&onlyIfLeader=true&onlyIfLeaderActive=true]
[junit4] 2> 38381 INFO (SocketProxy-Acceptor-38728) [ ]
o.a.s.c.SocketProxy accepted
Socket[addr=/127.0.0.1,port=55460,localport=38728], receiveBufferSize:531000
[junit4] 2> 38384 INFO (SocketProxy-Acceptor-38728) [ ]
o.a.s.c.SocketProxy proxy connection
Socket[addr=/127.0.0.1,port=45223,localport=56862], receiveBufferSize=530904
[junit4] 2> 38386 INFO (qtp30297920-421) [ ] o.a.s.h.a.PrepRecoveryOp
Going to wait for coreNodeName: core_node3, state: recovering, checkLive: true,
onlyIfLeader: true, onlyIfLeaderActive: true
[junit4] 2> 38386 INFO (qtp30297920-421) [ ] o.a.s.h.a.PrepRecoveryOp
Will wait a max of 183 seconds to see collection1 (shard2 of collection1) have
state: recovering
[junit4] 2> 38386 INFO (qtp30297920-421) [ ] o.a.s.h.a.PrepRecoveryOp
In WaitForState(recovering): collection=collection1, shard=shard2,
thisCore=collection1, leaderDoesNotNeedRecovery=false, isLeader? true,
live=true, checkLive=true, currentState=down, localState=active,
nodeName=127.0.0.1:33963_, coreNodeName=core_node3,
onlyIfActiveCheckResult=false, nodeProps:
core_node3:{"core":"collection1","base_url":"http://127.0.0.1:33963","node_name":"127.0.0.1:33963_","state":"down"}
[junit4] 2> 38784 INFO
(TEST-LeaderFailoverAfterPartitionTest.test-seed#[BAAC66F7AAB169E2]) [ ]
o.a.s.SolrTestCaseJ4 ###Starting test
[junit4] 2> 38784 INFO
(TEST-LeaderFailoverAfterPartitionTest.test-seed#[BAAC66F7AAB169E2]) [ ]
o.a.s.c.AbstractFullDistribZkTestBase Wait for recoveries to finish - wait
30000 for each attempt
[junit4] 2> 38784 INFO
(TEST-LeaderFailoverAfterPartitionTest.test-seed#[BAAC66F7AAB169E2]) [ ]
o.a.s.c.AbstractDistribZkTestBase Wait for recoveries to finish - collection:
collection1 failOnTimeout:true timeout (sec):30000
[junit4] 2> 39387 INFO (qtp30297920-421) [ ] o.a.s.h.a.PrepRecoveryOp
In WaitForState(recovering): collection=collection1, shard=shard2,
thisCore=collection1, leaderDoesNotNeedRecovery=false, isLeader? true,
live=true, checkLive=true, currentState=recovering, localState=active,
nodeName=127.0.0.1:33963_, coreNodeName=core_node3,
onlyIfActiveCheckResult=false, nodeProps:
core_node3:{"core":"collection1","base_url":"http://127.0.0.1:33963","node_name":"127.0.0.1:33963_","state":"recovering"}
[junit4] 2> 39387 INFO (qtp30297920-421) [ ] o.a.s.h.a.PrepRecoveryOp
Waited coreNodeName: core_node3, state: recovering, checkLive: true,
onlyIfLeader: true for: 1 seconds.
[junit4] 2> 39387 INFO (qtp30297920-421) [ ] o.a.s.s.HttpSolrCall
[admin] webapp=null path=/admin/cores
params={nodeName=127.0.0.1:33963_&onlyIfLeaderActive=true&core=collection1&coreNodeName=core_node3&action=PREPRECOVERY&checkLive=true&state=recovering&onlyIfLeader=true&wt=javabin&version=2}
status=0 QTime=1001
[junit4] 2> 46388 INFO (recoveryExecutor-92-thread-1) [ ]
o.a.s.c.RecoveryStrategy Attempting to PeerSync from
[http://127.0.0.1:38728/collection1/] - recoveringAfterStartup=[true]
[junit4] 2> 46393 INFO (recoveryExecutor-92-thread-1) [ ]
o.a.s.u.PeerSync PeerSync: core=collection1 url=http://127.0.0.1:33963 START
replicas=[http://127.0.0.1:38728/collection1/] nUpdates=100
[junit4] 2> 46395 INFO (SocketProxy-Acceptor-38728) [ ]
o.a.s.c.SocketProxy accepted
Socket[addr=/127.0.0.1,port=55464,localport=38728], receiveBufferSize:531000
[junit4] 2> 46396 INFO (SocketProxy-Acceptor-38728) [ ]
o.a.s.c.SocketProxy proxy connection
Socket[addr=/127.0.0.1,port=45223,localport=56866], receiveBufferSize=530904
[junit4] 2> 46405 INFO (qtp30297920-421) [ ] o.a.s.u.IndexFingerprint
IndexFingerprint millis:4.0 result:{maxVersionSpecified=9223372036854775807,
maxVersionEncountered=0, maxInHash=0, versionsHash=0, numVersions=0, numDocs=0,
maxDoc=0}
[junit4] 2> 46405 INFO (qtp30297920-421) [ ] o.a.s.c.S.Request
[collection1] webapp= path=/get
params={distrib=false&qt=/get&getFingerprint=9223372036854775807&wt=javabin&version=2}
status=0 QTime=6
[junit4] 2> 46408 INFO (recoveryExecutor-92-thread-1) [ ]
o.a.s.u.IndexFingerprint IndexFingerprint millis:0.0
result:{maxVersionSpecified=9223372036854775807, maxVersionEncountered=0,
maxInHash=0, versionsHash=0, numVersions=0, numDocs=0, maxDoc=0}
[junit4] 2> 46408 INFO (recoveryExecutor-92-thread-1) [ ]
o.a.s.u.PeerSync We are already in sync. No need to do a PeerSync
[junit4] 2> 46408 INFO (recoveryExecutor-92-thread-1) [ ]
o.a.s.u.DirectUpdateHandler2 start
commit{,optimize=false,openSearcher=true,waitSearcher=true,expungeDeletes=false,softCommit=false,prepareCommit=false}
[junit4] 2> 46408 INFO (recoveryExecutor-92-thread-1) [ ]
o.a.s.u.DirectUpdateHandler2 No uncommitted changes. Skipping IW.commit.
[junit4] 2> 46408 INFO (recoveryExecutor-92-thread-1) [ ]
o.a.s.u.DirectUpdateHandler2 end_commit_flush
[junit4] 2> 46408 INFO (recoveryExecutor-92-thread-1) [ ]
o.a.s.c.RecoveryStrategy PeerSync stage of recovery was successful.
[junit4] 2> 46408 INFO (recoveryExecutor-92-thread-1) [ ]
o.a.s.c.RecoveryStrategy Replaying updates buffered during PeerSync.
[junit4] 2> 46409 INFO (recoveryExecutor-92-thread-1) [ ]
o.a.s.c.RecoveryStrategy No replay needed.
[junit4] 2> 46409 INFO (recoveryExecutor-92-thread-1) [ ]
o.a.s.c.RecoveryStrategy Registering as Active after recovery.
[junit4] 2> 46786 INFO
(TEST-LeaderFailoverAfterPartitionTest.test-seed#[BAAC66F7AAB169E2]) [ ]
o.a.s.c.AbstractDistribZkTestBase Recoveries finished - collection: collection1
[junit4] 2> 46790 INFO (SocketProxy-Acceptor-32962) [ ]
o.a.s.c.SocketProxy accepted
Socket[addr=/127.0.0.1,port=42680,localport=32962], receiveBufferSize:531000
[junit4] 2> 46791 INFO (SocketProxy-Acceptor-32962) [ ]
o.a.s.c.SocketProxy proxy connection
Socket[addr=/127.0.0.1,port=36758,localport=36806], receiveBufferSize=530904
[junit4] 2> 46795 INFO (qtp10790278-383) [ ]
o.a.s.u.DirectUpdateHandler2 start
commit{,optimize=false,openSearcher=true,waitSearcher=true,expungeDeletes=false,softCommit=false,prepareCommit=false}
[junit4] 2> 46797 INFO (qtp10790278-383) [ ]
o.a.s.u.DirectUpdateHandler2 No uncommitted changes. Skipping IW.commit.
[junit4] 2> 46797 INFO (qtp10790278-383) [ ]
o.a.s.u.DirectUpdateHandler2 end_commit_flush
[junit4] 2> 46797 INFO (qtp10790278-383) [ ]
o.a.s.u.p.LogUpdateProcessorFactory [collection1] webapp= path=/update
params={waitSearcher=true&commit=true&softCommit=false&wt=javabin&version=2}{commit=}
0 3
[junit4] 2> 46799 INFO (SocketProxy-Acceptor-38728) [ ]
o.a.s.c.SocketProxy accepted
Socket[addr=/127.0.0.1,port=55472,localport=38728], receiveBufferSize:531000
[junit4] 2> 46801 INFO (SocketProxy-Acceptor-38728) [ ]
o.a.s.c.SocketProxy proxy connection
Socket[addr=/127.0.0.1,port=45223,localport=56874], receiveBufferSize=530904
[junit4] 2> 46808 INFO (SocketProxy-Acceptor-33079) [ ]
o.a.s.c.SocketProxy accepted
Socket[addr=/127.0.0.1,port=46874,localport=33079], receiveBufferSize:531000
[junit4] 2> 46810 INFO (SocketProxy-Acceptor-33963) [ ]
o.a.s.c.SocketProxy accepted
Socket[addr=/127.0.0.1,port=34988,localport=33963], receiveBufferSize:531000
[junit4] 2> 46810 INFO (SocketProxy-Acceptor-38728) [ ]
o.a.s.c.SocketProxy accepted
Socket[addr=/127.0.0.1,port=55476,localport=38728], receiveBufferSize:531000
[junit4] 2> 46810 INFO (SocketProxy-Acceptor-33079) [ ]
o.a.s.c.SocketProxy proxy connection
Socket[addr=/127.0.0.1,port=45354,localport=37842], receiveBufferSize=530904
[junit4] 2> 46813 INFO (SocketProxy-Acceptor-33963) [ ]
o.a.s.c.SocketProxy proxy connection
Socket[addr=/127.0.0.1,port=40102,localport=38052], receiveBufferSize=530904
[junit4] 2> 46813 INFO (SocketProxy-Acceptor-38728) [ ]
o.a.s.c.SocketProxy proxy connection
Socket[addr=/127.0.0.1,port=45223,localport=56886], receiveBufferSize=530904
[junit4] 2> 46815 INFO (qtp10100200-450) [ ]
o.a.s.u.DirectUpdateHandler2 start
commit{,optimize=false,openSearcher=true,waitSearcher=true,expungeDeletes=false,softCommit=false,prepareCommit=false}
[junit4] 2> 46815 INFO (qtp30297920-421) [ ]
o.a.s.u.DirectUpdateHandler2 start
commit{,optimize=false,openSearcher=true,waitSearcher=true,expungeDeletes=false,softCommit=false,prepareCommit=false}
[junit4] 2> 46815 INFO (qtp30297920-421) [ ]
o.a.s.u.DirectUpdateHandler2 No uncommitted changes. Skipping IW.commit.
[junit4] 2> 46816 INFO (qtp10100200-450) [ ]
o.a.s.u.DirectUpdateHandler2 No uncommitted changes. Skipping IW.commit.
[junit4] 2> 46817 INFO (qtp30297920-421) [ ]
o.a.s.u.DirectUpdateHandler2 end_commit_flush
[junit4] 2> 46817 INFO (qtp30297920-421) [ ]
o.a.s.u.p.LogUpdateProcessorFactory [collection1] webapp= path=/update
params={update.distrib=FROMLEADER&waitSearcher=true&openSearcher=true&commit=true&softCommit=false&distrib.from=http://127.0.0.1:38728/collection1/&commit_end_point=true&wt=javabin&version=2&expungeDeletes=false}{commit=}
0 1
[junit4] 2> 46817 INFO (qtp9962148-479) [ ]
o.a.s.u.DirectUpdateHandler2 start
commit{,optimize=false,openSearcher=true,waitSearcher=true,expungeDeletes=false,softCommit=false,prepareCommit=false}
[junit4] 2> 46820 INFO (qtp9962148-479) [ ]
o.a.s.u.DirectUpdateHandler2 No uncommitted changes. Skipping IW.commit.
[junit4] 2> 46820 INFO (qtp10100200-450) [ ]
o.a.s.u.DirectUpdateHandler2 end_commit_flush
[junit4] 2> 46820 INFO (qtp10100200-450) [ ]
o.a.s.u.p.LogUpdateProcessorFactory [collection1] webapp= path=/update
params={update.distrib=FROMLEADER&waitSearcher=true&openSearcher=true&commit=true&softCommit=false&distrib.from=http://127.0.0.1:38728/collection1/&commit_end_point=true&wt=javabin&version=2&expungeDeletes=false}{commit=}
0 5
[junit4] 2> 46820 INFO (qtp9962148-479) [ ]
o.a.s.u.DirectUpdateHandler2 end_commit_flush
[junit4] 2> 46820 INFO (qtp9962148-479) [ ]
o.a.s.u.p.LogUpdateProcessorFactory [collection1] webapp= path=/update
params={update.distrib=FROMLEADER&waitSearcher=true&openSearcher=true&commit=true&softCommit=false&distrib.from=http://127.0.0.1:38728/collection1/&commit_end_point=true&wt=javabin&version=2&expungeDeletes=false}{commit=}
0 3
[junit4] 2> 46821 INFO (qtp30297920-423) [ ]
o.a.s.u.p.LogUpdateProcessorFactory [collection1] webapp= path=/update
params={waitSearcher=true&commit=true&softCommit=false&wt=javabin&version=2}{commit=}
0 18
[junit4] 2> 46825 INFO (SocketProxy-Acceptor-38728) [ ]
o.a.s.c.SocketProxy accepted
Socket[addr=/127.0.0.1,port=55488,localport=38728], receiveBufferSize:531000
[junit4] 2> 46826 INFO (SocketProxy-Acceptor-38728) [ ]
o.a.s.c.SocketProxy proxy connection
Socket[addr=/127.0.0.1,port=45223,localport=56890], receiveBufferSize=530904
[junit4] 2> 46828 INFO (qtp30297920-419) [ ] o.a.s.c.S.Request
[collection1] webapp= path=/select
params={q=*:*&distrib=false&tests=checkShardConsistency&rows=0&wt=javabin&version=2}
hits=0 status=0 QTime=1
[junit4] 2> 46830 INFO (SocketProxy-Acceptor-33963) [ ]
o.a.s.c.SocketProxy accepted
Socket[addr=/127.0.0.1,port=34998,localport=33963], receiveBufferSize:531000
[junit4] 2> 46831 INFO (SocketProxy-Acceptor-33963) [ ]
o.a.s.c.SocketProxy proxy connection
Socket[addr=/127.0.0.1,port=40102,localport=38062], receiveBufferSize=530904
[junit4] 2> 46833 INFO (qtp9962148-481) [ ] o.a.s.c.S.Request
[collection1] webapp= path=/select
params={q=*:*&distrib=false&tests=checkShardConsistency&rows=0&wt=javabin&version=2}
hits=0 status=0 QTime=0
[junit4] 2> 46834 INFO (SocketProxy-Acceptor-33079) [ ]
o.a.s.c.SocketProxy accepted
Socket[addr=/127.0.0.1,port=46892,localport=33079], receiveBufferSize:531000
[junit4] 2> 46835 INFO (SocketProxy-Acceptor-33079) [ ]
o.a.s.c.SocketProxy proxy connection
Socket[addr=/127.0.0.1,port=45354,localport=37860], receiveBufferSize=530904
[junit4] 2> 46838 INFO (qtp10100200-451) [ ] o.a.s.c.S.Request
[collection1] webapp= path=/select
params={q=*:*&distrib=false&tests=checkShardConsistency&rows=0&wt=javabin&version=2}
hits=0 status=0 QTime=0
[junit4] 2> 48839 INFO
(TEST-LeaderFailoverAfterPartitionTest.test-seed#[BAAC66F7AAB169E2]) [ ]
o.a.s.c.AbstractFullDistribZkTestBase Creating collection with stateFormat=1:
c8n_1x3_lf
[junit4] 2> 48841 INFO (SocketProxy-Acceptor-38728) [ ]
o.a.s.c.SocketProxy accepted
Socket[addr=/127.0.0.1,port=55510,localport=38728], receiveBufferSize:531000
[junit4] 2> 48842 INFO (SocketProxy-Acceptor-38728) [ ]
o.a.s.c.SocketProxy proxy connection
Socket[addr=/127.0.0.1,port=45223,localport=56912], receiveBufferSize=530904
[junit4] 2> 48844 INFO (qtp30297920-423) [ ]
o.a.s.h.a.CollectionsHandler Invoked Collection Action :create with params
replicationFactor=3&maxShardsPerNode=1&name=c8n_1x3_lf&action=CREATE&numShards=1&stateFormat=1&wt=javabin&version=2
and sendToOCPQueue=true
[junit4] 2> 48856 INFO (OverseerThreadFactory-220-thread-1) [ ]
o.a.s.c.CreateCollectionCmd Create collection c8n_1x3_lf
[junit4] 2> 48857 INFO (OverseerThreadFactory-220-thread-1) [ ]
o.a.s.c.CreateCollectionCmd Only one config set found in zk - using it:conf1
[junit4] 2> 48968 INFO (SocketProxy-Acceptor-32962) [ ]
o.a.s.c.SocketProxy accepted
Socket[addr=/127.0.0.1,port=42728,localport=32962], receiveBufferSize:531000
[junit4] 2> 48968 INFO (SocketProxy-Acceptor-33963) [ ]
o.a.s.c.SocketProxy accepted
Socket[addr=/127.0.0.1,port=35020,localport=33963], receiveBufferSize:531000
[junit4] 2> 48968 INFO (SocketProxy-Acceptor-33079) [ ]
o.a.s.c.SocketProxy accepted
Socket[addr=/127.0.0.1,port=46914,localport=33079], receiveBufferSize:531000
[junit4] 2> 48969 INFO (SocketProxy-Acceptor-32962) [ ]
o.a.s.c.SocketProxy proxy connection
Socket[addr=/127.0.0.1,port=36758,localport=36856], receiveBufferSize=530904
[junit4] 2> 48973 INFO (SocketProxy-Acceptor-33079) [ ]
o.a.s.c.SocketProxy proxy connection
Socket[addr=/127.0.0.1,port=45354,localport=37886], receiveBufferSize=530904
[junit4] 2> 48974 INFO (SocketProxy-Acceptor-33963) [ ]
o.a.s.c.SocketProxy proxy connection
Socket[addr=/127.0.0.1,port=40102,localport=38090], receiveBufferSize=530904
[junit4] 2> 48981 INFO (qtp10790278-384) [ ]
o.a.s.h.a.CoreAdminOperation core create command
qt=/admin/cores&collection.configName=conf1&newCollection=true&name=c8n_1x3_lf_shard1_replica2&action=CREATE&numShards=1&collection=c8n_1x3_lf&shard=shard1&wt=javabin&version=2
[junit4] 2> 48981 INFO (qtp10100200-450) [ ]
o.a.s.h.a.CoreAdminOperation core create command
qt=/admin/cores&collection.configName=conf1&newCollection=true&name=c8n_1x3_lf_shard1_replica1&action=CREATE&numShards=1&collection=c8n_1x3_lf&shard=shard1&wt=javabin&version=2
[junit4] 2> 48985 INFO (qtp9962148-479) [ ]
o.a.s.h.a.CoreAdminOperation core create command
qt=/admin/cores&collection.configName=conf1&newCollection=true&name=c8n_1x3_lf_shard1_replica3&action=CREATE&numShards=1&collection=c8n_1x3_lf&shard=shard1&wt=javabin&version=2
[junit4] 2> 50004 INFO (qtp10100200-450) [ ] o.a.s.c.SolrConfig Using
Lucene MatchVersion: 6.5.0
[junit4] 2> 50022 INFO (qtp9962148-479) [ ] o.a.s.c.SolrConfig Using
Lucene MatchVersion: 6.5.0
[junit4] 2> 50023 INFO (qtp10790278-384) [ ] o.a.s.c.SolrConfig Using
Lucene MatchVersion: 6.5.0
[junit4] 2> 50046 INFO (qtp9962148-479) [ ] o.a.s.s.IndexSchema
[c8n_1x3_lf_shard1_replica3] Schema name=test
[junit4] 2> 50058 INFO (qtp10100200-450) [ ] o.a.s.s.IndexSchema
[c8n_1x3_lf_shard1_replica1] Schema name=test
[junit4] 2> 50062 INFO (qtp10790278-384) [ ] o.a.s.s.IndexSchema
[c8n_1x3_lf_shard1_replica2] Schema name=test
[junit4] 2> 50244 WARN (qtp10100200-450) [ ] o.a.s.s.IndexSchema
[c8n_1x3_lf_shard1_replica1] default search field in schema is text. WARNING:
Deprecated, please use 'df' on request instead.
[junit4] 2> 50253 INFO (qtp10100200-450) [ ] o.a.s.s.IndexSchema
Loaded schema test/1.0 with uniqueid field id
[junit4] 2> 50269 INFO (qtp10100200-450) [ ] o.a.s.c.CoreContainer
Creating SolrCore 'c8n_1x3_lf_shard1_replica1' using configuration from
collection c8n_1x3_lf
[junit4] 2> 50269 INFO (qtp10100200-450) [ ] o.a.s.c.SolrCore
[[c8n_1x3_lf_shard1_replica1] ] Opening new SolrCore at
[/home/jenkins/workspace/Lucene-Solr-6.x-Linux/solr/build/solr-core/test/J2/temp/solr.cloud.LeaderFailoverAfterPartitionTest_BAAC66F7AAB169E2-001/shard-2-001/cores/c8n_1x3_lf_shard1_replica1],
dataDir=[/home/jenkins/workspace/Lucene-Solr-6.x-Linux/solr/build/solr-core/test/J2/temp/solr.cloud.LeaderFailoverAfterPartitionTest_BAAC66F7AAB169E2-001/shard-2-001/cores/c8n_1x3_lf_shard1_replica1/data/]
[junit4] 2> 50270 INFO (qtp10100200-450) [ ] o.a.s.c.JmxMonitoredMap
JMX monitoring is enabled. Adding Solr mbeans to JMX Server:
com.sun.jmx.mbeanserver.JmxMBeanServer@239cb7
[junit4] 2> 50271 WARN (qtp9962148-479) [ ] o.a.s.s.IndexSchema
[c8n_1x3_lf_shard1_replica3] default search field in schema is text. WARNING:
Deprecated, please use 'df' on request instead.
[junit4] 2> 50271 WARN (qtp10790278-384) [ ] o.a.s.s.IndexSchema
[c8n_1x3_lf_shard1_replica2] default search field in schema is text. WARNING:
Deprecated, please use 'df' on request instead.
[junit4] 2> 50272 INFO (qtp10100200-450) [ ] o.a.s.u.RandomMergePolicy
RandomMergePolicy wrapping class org.apache.lucene.index.LogDocMergePolicy:
[LogDocMergePolicy: minMergeSize=1000, mergeFactor=41,
maxMergeSize=9223372036854775807,
maxMergeSizeForForcedMerge=9223372036854775807, calibrateSizeByDeletes=true,
maxMergeDocs=2147483647, maxCFSSegmentSizeMB=8.796093022207999E12,
noCFSRatio=0.5913324068191124]
[junit4] 2> 50284 INFO (qtp9962148-479) [ ] o.a.s.s.IndexSchema Loaded
schema test/1.0 with uniqueid field id
[junit4] 2> 50284 INFO (qtp10790278-384) [ ] o.a.s.s.IndexSchema
Loaded schema test/1.0 with uniqueid field id
[junit4] 2> 50291 WARN (qtp10100200-450) [ ] o.a.s.c.RequestHandlers
INVALID paramSet a in requestHandler {type = requestHandler,name = /dump,class
= DumpRequestHandler,attributes = {initParams=a, name=/dump,
class=DumpRequestHandler},args = {defaults={a=A,b=B}}}
[junit4] 2> 50300 INFO (qtp10790278-384) [ ] o.a.s.c.CoreContainer
Creating SolrCore 'c8n_1x3_lf_shard1_replica2' using configuration from
collection c8n_1x3_lf
[junit4] 2> 50301 INFO (qtp10790278-384) [ ] o.a.s.c.SolrCore
[[c8n_1x3_lf_shard1_replica2] ] Opening new SolrCore at
[/home/jenkins/workspace/Lucene-Solr-6.x-Linux/solr/build/solr-core/test/J2/temp/solr.cloud.LeaderFailoverAfterPartitionTest_BAAC66F7AAB169E2-001/control-001/cores/c8n_1x3_lf_shard1_replica2],
dataDir=[/home/jenkins/workspace/Lucene-Solr-6.x-Linux/solr/build/solr-core/test/J2/temp/solr.cloud.LeaderFailoverAfterPartitionTest_BAAC66F7AAB169E2-001/control-001/cores/c8n_1x3_lf_shard1_replica2/data/]
[junit4] 2> 50304 INFO (qtp10790278-384) [ ] o.a.s.c.JmxMonitoredMap
JMX monitoring is enabled. Adding Solr mbeans to JMX Server:
com.sun.jmx.mbeanserver.JmxMBeanServer@239cb7
[junit4] 2> 50307 INFO (qtp10790278-384) [ ] o.a.s.u.RandomMergePolicy
RandomMergePolicy wrapping class org.apache.lucene.index.LogDocMergePolicy:
[LogDocMergePolicy: minMergeSize=1000, mergeFactor=41,
maxMergeSize=9223372036854775807,
maxMergeSizeForForcedMerge=9223372036854775807, calibrateSizeByDeletes=true,
maxMergeDocs=2147483647, maxCFSSegmentSizeMB=8.796093022207999E12,
noCFSRatio=0.5913324068191124]
[junit4] 2> 50309 INFO (qtp10100200-450) [ ] o.a.s.u.UpdateHandler
Using UpdateLog implementation: org.apache.solr.update.UpdateLog
[junit4] 2> 50311 INFO (qtp10100200-450) [ ] o.a.s.u.UpdateLog
Initializing UpdateLog: dataDir= defaultSyncLevel=FLUSH numRecordsToKeep=100
maxNumLogsToKeep=10 numVersionBuckets=65536
[junit4] 2> 50312 INFO (qtp9962148-479) [ ] o.a.s.c.CoreContainer
Creating SolrCore 'c8n_1x3_lf_shard1_replica3' using configuration from
collection c8n_1x3_lf
[junit4] 2> 50312 INFO (qtp9962148-479) [ ] o.a.s.c.SolrCore
[[c8n_1x3_lf_shard1_replica3] ] Opening new SolrCore at
[/home/jenkins/workspace/Lucene-Solr-6.x-Linux/solr/build/solr-core/test/J2/temp/solr.cloud.LeaderFailoverAfterPartitionTest_BAAC66F7AAB169E2-001/shard-3-001/cores/c8n_1x3_lf_shard1_replica3],
dataDir=[/home/jenkins/workspace/Lucene-Solr-6.x-Linux/solr/build/solr-core/test/J2/temp/solr.cloud.LeaderFailoverAfterPartitionTest_BAAC66F7AAB169E2-001/shard-3-001/cores/c8n_1x3_lf_shard1_replica3/data/]
[junit4] 2> 50313 INFO (qtp9962148-479) [ ] o.a.s.c.JmxMonitoredMap
JMX monitoring is enabled. Adding Solr mbeans to JMX Server:
com.sun.jmx.mbeanserver.JmxMBeanServer@239cb7
[junit4] 2> 50313 INFO (qtp10100200-450) [ ] o.a.s.u.CommitTracker
Hard AutoCommit: disabled
[junit4] 2> 50313 INFO (qtp10100200-450) [ ] o.a.s.u.CommitTracker
Soft AutoCommit: disabled
[junit4] 2> 50314 INFO (qtp10100200-450) [ ] o.a.s.u.RandomMergePolicy
RandomMergePolicy wrapping class
org.apache.lucene.index.LogByteSizeMergePolicy: [LogByteSizeMergePolicy:
minMergeSize=1677721, mergeFactor=32, maxMergeSize=2147483648,
maxMergeSizeForForcedMerge=9223372036854775807, calibrateSizeByDeletes=false,
maxMergeDocs=2147483647, maxCFSSegmentSizeMB=8.796093022207999E12,
noCFSRatio=0.0]
[junit4] 2> 50314 INFO (qtp10100200-450) [ ] o.a.s.s.SolrIndexSearcher
Opening [Searcher@17c0cbf[c8n_1x3_lf_shard1_replica1] main]
[junit4] 2> 50315 INFO (qtp9962148-479) [ ] o.a.s.u.RandomMergePolicy
RandomMergePolicy wrapping class org.apache.lucene.index.LogDocMergePolicy:
[LogDocMergePolicy: minMergeSize=1000, mergeFactor=41,
maxMergeSize=9223372036854775807,
maxMergeSizeForForcedMerge=9223372036854775807, calibrateSizeByDeletes=true,
maxMergeDocs=2147483647, maxCFSSegmentSizeMB=8.796093022207999E12,
noCFSRatio=0.5913324068191124]
[junit4] 2> 50315 INFO (qtp10100200-450) [ ]
o.a.s.r.ManagedResourceStorage Configured ZooKeeperStorageIO with znodeBase:
/configs/conf1
[junit4] 2> 50316 INFO (qtp10100200-450) [ ]
o.a.s.r.ManagedResourceStorage Loaded null at path _rest_managed.json using
ZooKeeperStorageIO:path=/configs/conf1
[junit4] 2> 50316 INFO (qtp10100200-450) [ ]
o.a.s.h.ReplicationHandler Commits will be reserved for 10000
[junit4] 2> 50317 INFO (searcherExecutor-261-thread-1) [ ]
o.a.s.c.SolrCore [c8n_1x3_lf_shard1_replica1] Registered new searcher
Searcher@17c0cbf[c8n_1x3_lf_shard1_replica1]
main{ExitableDirectoryReader(UninvertingDirectoryReader())}
[junit4] 2> 50318 INFO (qtp10100200-450) [ ] o.a.s.u.UpdateLog Could
not find max version in index or recent updates, using new clock
1558198495752486912
[junit4] 2> 50323 INFO (qtp10100200-450) [ ]
o.a.s.c.ShardLeaderElectionContext Waiting until we see more replicas up for
shard shard1: total=3 found=1 timeoutin=9999ms
[junit4] 2> 50325 WARN (qtp9962148-479) [ ] o.a.s.c.RequestHandlers
INVALID paramSet a in requestHandler {type = requestHandler,name = /dump,class
= DumpRequestHandler,attributes = {initParams=a, name=/dump,
class=DumpRequestHandler},args = {defaults={a=A,b=B}}}
[junit4] 2> 50326 WARN (qtp10790278-384) [ ] o.a.s.c.RequestHandlers
INVALID paramSet a in requestHandler {type = requestHandler,name = /dump,class
= DumpRequestHandler,attributes = {initParams=a, name=/dump,
class=DumpRequestHandler},args = {defaults={a=A,b=B}}}
[junit4] 2> 50344 INFO (qtp9962148-479) [ ] o.a.s.u.UpdateHandler
Using UpdateLog implementation: org.apache.solr.update.UpdateLog
[junit4] 2> 50344 INFO (qtp9962148-479) [ ] o.a.s.u.UpdateLog
Initializing UpdateLog: dataDir= defaultSyncLevel=FLUSH numRecordsToKeep=100
maxNumLogsToKeep=10 numVersionBuckets=65536
[junit4] 2> 50345 INFO (qtp10790278-384) [ ] o.a.s.u.UpdateHandler
Using UpdateLog implementation: org.apache.solr.update.UpdateLog
[junit4] 2> 50345 INFO (qtp10790278-384) [ ] o.a.s.u.UpdateLog
Initializing UpdateLog: dataDir= defaultSyncLevel=FLUSH numRecordsToKeep=100
maxNumLogsToKeep=10 numVersionBuckets=65536
[junit4] 2> 50346 INFO (qtp9962148-479) [ ] o.a.s.u.CommitTracker Hard
AutoCommit: disabled
[junit4] 2> 50346 INFO (qtp9962148-479) [ ] o.a.s.u.CommitTracker Soft
AutoCommit: disabled
[junit4] 2> 50361 INFO (qtp10790278-384) [ ] o.a.s.u.CommitTracker
Hard AutoCommit: disabled
[junit4] 2> 50361 INFO (qtp9962148-479) [ ] o.a.s.u.RandomMergePolicy
RandomMergePolicy wrapping class
org.apache.lucene.index.LogByteSizeMergePolicy: [LogByteSizeMergePolicy:
minMergeSize=1677721, mergeFactor=32, maxMergeSize=2147483648,
maxMergeSizeForForcedMerge=9223372036854775807, calibrateSizeByDeletes=false,
maxMergeDocs=2147483647, maxCFSSegmentSizeMB=8.796093022207999E12,
noCFSRatio=0.0]
[junit4] 2> 50361 INFO (qtp10790278-384) [ ] o.a.s.u.CommitTracker
Soft AutoCommit: disabled
[junit4] 2> 50362 INFO (qtp10790278-384) [ ] o.a.s.u.RandomMergePolicy
RandomMergePolicy wrapping class
org.apache.lucene.index.LogByteSizeMergePolicy: [LogByteSizeMergePolicy:
minMergeSize=1677721, mergeFactor=32, maxMergeSize=2147483648,
maxMergeSizeForForcedMerge=9223372036854775807, calibrateSizeByDeletes=false,
maxMergeDocs=2147483647, maxCFSSegmentSizeMB=8.796093022207999E12,
noCFSRatio=0.0]
[junit4] 2> 50362 INFO (qtp9962148-479) [ ] o.a.s.s.SolrIndexSearcher
Opening [Searcher@1aa9587[c8n_1x3_lf_shard1_replica3] main]
[junit4] 2> 50363 INFO (qtp10790278-384) [ ] o.a.s.s.SolrIndexSearcher
Opening [Searcher@596d4a[c8n_1x3_lf_shard1_replica2] main]
[junit4] 2> 50363 INFO (qtp9962148-479) [ ]
o.a.s.r.ManagedResourceStorage Configured ZooKeeperStorageIO with znodeBase:
/configs/conf1
[junit4] 2> 50364 INFO (qtp9962148-479) [ ]
o.a.s.r.ManagedResourceStorage Loaded null at path _rest_managed.json using
ZooKeeperStorageIO:path=/configs/conf1
[junit4] 2> 50364 INFO (qtp9962148-479) [ ] o.a.s.h.ReplicationHandler
Commits will be reserved for 10000
[junit4] 2> 50364 INFO (qtp10790278-384) [ ]
o.a.s.r.ManagedResourceStorage Configured ZooKeeperStorageIO with znodeBase:
/configs/conf1
[junit4] 2> 50365 INFO (qtp10790278-384) [ ]
o.a.s.r.ManagedResourceStorage Loaded null at path _rest_managed.json using
ZooKeeperStorageIO:path=/configs/conf1
[junit4] 2> 50365 INFO (qtp10790278-384) [ ]
o.a.s.h.ReplicationHandler Commits will be reserved for 10000
[junit4] 2> 50366 INFO (searcherExecutor-265-thread-1) [ ]
o.a.s.c.SolrCore [c8n_1x3_lf_shard1_replica3] Registered new searcher
Searcher@1aa9587[c8n_1x3_lf_shard1_replica3]
main{ExitableDirectoryReader(UninvertingDirectoryReader())}
[junit4] 2> 50366 INFO (searcherExecutor-263-thread-1) [ ]
o.a.s.c.SolrCore [c8n_1x3_lf_shard1_replica2] Registered new searcher
Searcher@596d4a[c8n_1x3_lf_shard1_replica2]
main{ExitableDirectoryReader(UninvertingDirectoryReader())}
[junit4] 2> 50366 INFO (qtp10790278-384) [ ] o.a.s.u.UpdateLog Could
not find max version in index or recent updates, using new clock
1558198495802818560
[junit4] 2> 50366 INFO (qtp9962148-479) [ ] o.a.s.u.UpdateLog Could
not find max version in index or recent updates, using new clock
1558198495802818560
[junit4] 2> 50823 INFO (qtp10100200-450) [ ]
o.a.s.c.ShardLeaderElectionContext Enough replicas found to continue.
[junit4] 2> 50823 INFO (qtp10100200-450) [ ]
o.a.s.c.ShardLeaderElectionContext I may be the new leader - try and sync
[junit4] 2> 50823 INFO (qtp10100200-450) [ ] o.a.s.c.SyncStrategy Sync
replicas to http://127.0.0.1:33079/c8n_1x3_lf_shard1_replica1/
[junit4] 2> 50824 INFO (qtp10100200-450) [ ] o.a.s.u.PeerSync
PeerSync: core=c8n_1x3_lf_shard1_replica1 url=http://127.0.0.1:33079 START
replicas=[http://127.0.0.1:32962/c8n_1x3_lf_shard1_replica2/,
http://127.0.0.1:33963/c8n_1x3_lf_shard1_replica3/] nUpdates=100
[junit4] 2> 50824 INFO (qtp10100200-450) [ ] o.a.s.u.PeerSync
PeerSync: core=c8n_1x3_lf_shard1_replica1 url=http://127.0.0.1:33079 DONE. We
have no versions. sync failed.
[junit4] 2> 50827 INFO (SocketProxy-Acceptor-33963) [ ]
o.a.s.c.SocketProxy accepted
Socket[addr=/127.0.0.1,port=35046,localport=33963], receiveBufferSize:531000
[junit4] 2> 50827 INFO (SocketProxy-Acceptor-32962) [ ]
o.a.s.c.SocketProxy accepted
Socket[addr=/127.0.0.1,port=42756,localport=32962], receiveBufferSize:531000
[junit4] 2> 50829 INFO (SocketProxy-Acceptor-33963) [ ]
o.a.s.c.SocketProxy proxy connection
Socket[addr=/127.0.0.1,port=40102,localport=38110], receiveBufferSize=530904
[junit4] 2> 50829 INFO (SocketProxy-Acceptor-32962) [ ]
o.a.s.c.SocketProxy proxy connection
Socket[addr=/127.0.0.1,port=36758,localport=36882], receiveBufferSize=530904
[junit4] 2> 50841 INFO (qtp10790278-383) [ ] o.a.s.c.S.Request
[c8n_1x3_lf_shard1_replica2] webapp= path=/get
params={distrib=false&qt=/get&fingerprint=false&getVersions=100&wt=javabin&version=2}
status=0 QTime=7
[junit4] 2> 50851 INFO (qtp9962148-477) [ ] o.a.s.c.S.Request
[c8n_1x3_lf_shard1_replica3] webapp= path=/get
params={distrib=false&qt=/get&fingerprint=false&getVersions=100&wt=javabin&version=2}
status=0 QTime=1
[junit4] 2> 50852 INFO (qtp10100200-450) [ ] o.a.s.c.SyncStrategy
Leader's attempt to sync with shard failed, moving to the next candidate
[junit4] 2> 50853 INFO (qtp10100200-450) [ ]
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> 50860 INFO (qtp10100200-450) [ ]
o.a.s.c.ShardLeaderElectionContext I am the new leader:
http://127.0.0.1:33079/c8n_1x3_lf_shard1_replica1/ shard1
[junit4] 2> 51012 INFO (qtp10100200-450) [ ] o.a.s.c.ZkController I am
the leader, no recovery necessary
[junit4] 2> 51015 INFO (qtp10100200-450) [ ] o.a.s.s.HttpSolrCall
[admin] webapp=null path=/admin/cores
params={qt=/admin/cores&collection.configName=conf1&newCollection=true&name=c8n_1x3_lf_shard1_replica1&action=CREATE&numShards=1&collection=c8n_1x3_lf&shard=shard1&wt=javabin&version=2}
status=0 QTime=2034
[junit4] 2> 51373 INFO (qtp10790278-384) [ ] o.a.s.s.HttpSolrCall
[admin] webapp=null path=/admin/cores
params={qt=/admin/cores&collection.configName=conf1&newCollection=true&name=c8n_1x3_lf_shard1_replica2&action=CREATE&numShards=1&collection=c8n_1x3_lf&shard=shard1&wt=javabin&version=2}
status=0 QTime=2392
[junit4] 2> 51373 INFO (qtp9962148-479) [ ] o.a.s.s.HttpSolrCall
[admin] webapp=null path=/admin/cores
params={qt=/admin/cores&collection.configName=conf1&newCollection=true&name=c8n_1x3_lf_shard1_replica3&action=CREATE&numShards=1&collection=c8n_1x3_lf&shard=shard1&wt=javabin&version=2}
status=0 QTime=2388
[junit4] 2> 51379 INFO (qtp30297920-423) [ ]
o.a.s.h.a.CollectionsHandler Wait for new collection to be active for at most
30 seconds. Check all shard replicas
[junit4] 2> 52379 INFO (qtp30297920-423) [ ] o.a.s.s.HttpSolrCall
[admin] webapp=null path=/admin/collections
params={replicationFactor=3&maxShardsPerNode=1&name=c8n_1x3_lf&action=CREATE&numShards=1&stateFormat=1&wt=javabin&version=2}
status=0 QTime=3534
[junit4] 2> 52382 INFO (SocketProxy-Acceptor-33079) [ ]
o.a.s.c.SocketProxy accepted
Socket[addr=/127.0.0.1,port=46944,localport=33079], receiveBufferSize:531000
[junit4] 2> 52382 INFO (SocketProxy-Acceptor-33079) [ ]
o.a.s.c.SocketProxy proxy connection
Socket[addr=/127.0.0.1,port=45354,localport=37912], receiveBufferSize=530904
[junit4] 2> 52444 INFO (qtp9962148-476) [ ]
o.a.s.u.p.LogUpdateProcessorFactory [c8n_1x3_lf_shard1_replica3] webapp=
path=/update
params={update.distrib=FROMLEADER&distrib.from=http://127.0.0.1:33079/c8n_1x3_lf_shard1_replica1/&wt=javabin&version=2}{add=[1
(15581984979230
[...truncated too long message...]
admin.MBeansHandlerTest_BAAC66F7AAB169E2-001/init-core-data-001/]
[junit4] 2> 447103 INFO (coreLoadExecutor-1963-thread-1) [ ]
o.a.s.c.JmxMonitoredMap JMX monitoring is enabled. Adding Solr mbeans to JMX
Server: com.sun.jmx.mbeanserver.JmxMBeanServer@1c2de72
[junit4] 2> 447105 INFO (coreLoadExecutor-1963-thread-1) [ ]
o.a.s.u.RandomMergePolicy RandomMergePolicy wrapping class
org.apache.lucene.index.LogDocMergePolicy: [LogDocMergePolicy:
minMergeSize=1000, mergeFactor=30, maxMergeSize=9223372036854775807,
maxMergeSizeForForcedMerge=9223372036854775807, calibrateSizeByDeletes=false,
maxMergeDocs=2147483647, maxCFSSegmentSizeMB=8.796093022207999E12,
noCFSRatio=1.0]
[junit4] 2> 447151 INFO (coreLoadExecutor-1963-thread-1) [ ]
o.a.s.u.UpdateHandler Using UpdateLog implementation:
org.apache.solr.update.UpdateLog
[junit4] 2> 447151 INFO (coreLoadExecutor-1963-thread-1) [ ]
o.a.s.u.UpdateLog Initializing UpdateLog: dataDir= defaultSyncLevel=FLUSH
numRecordsToKeep=100 maxNumLogsToKeep=10 numVersionBuckets=65536
[junit4] 2> 447152 INFO (coreLoadExecutor-1963-thread-1) [ ]
o.a.s.u.CommitTracker Hard AutoCommit: disabled
[junit4] 2> 447152 INFO (coreLoadExecutor-1963-thread-1) [ ]
o.a.s.u.CommitTracker Soft AutoCommit: disabled
[junit4] 2> 447153 INFO (coreLoadExecutor-1963-thread-1) [ ]
o.a.s.u.RandomMergePolicy RandomMergePolicy wrapping class
org.apache.lucene.index.AlcoholicMergePolicy: [AlcoholicMergePolicy:
minMergeSize=0, mergeFactor=10, maxMergeSize=682298022,
maxMergeSizeForForcedMerge=9223372036854775807, calibrateSizeByDeletes=true,
maxMergeDocs=2147483647, maxCFSSegmentSizeMB=8.796093022207999E12,
noCFSRatio=0.1]
[junit4] 2> 447160 INFO (coreLoadExecutor-1963-thread-1) [ ]
o.a.s.s.SolrIndexSearcher Opening [Searcher@f27f24[collection1] main]
[junit4] 2> 447160 INFO (coreLoadExecutor-1963-thread-1) [ ]
o.a.s.h.c.SpellCheckComponent Initializing spell checkers
[junit4] 2> 447209 INFO (coreLoadExecutor-1963-thread-1) [ ]
o.a.s.s.DirectSolrSpellChecker init:
{name=direct,classname=DirectSolrSpellChecker,field=lowerfilt,minQueryLength=3}
[junit4] 2> 447414 INFO (coreLoadExecutor-1963-thread-1) [ ]
o.a.s.h.ReplicationHandler Commits will be reserved for 10000
[junit4] 2> 447414 INFO (searcherExecutor-1964-thread-1) [ ]
o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: default
[junit4] 2> 447415 INFO (searcherExecutor-1964-thread-1) [ ]
o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: direct
[junit4] 2> 447415 INFO (searcherExecutor-1964-thread-1) [ ]
o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: wordbreak
[junit4] 2> 447415 INFO (searcherExecutor-1964-thread-1) [ ]
o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker:
multipleFields
[junit4] 2> 447417 INFO (searcherExecutor-1964-thread-1) [ ]
o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: jarowinkler
[junit4] 2> 447417 INFO (coreLoadExecutor-1963-thread-1) [ ]
o.a.s.u.UpdateLog Could not find max version in index or recent updates, using
new clock 1558198911862046720
[junit4] 2> 447418 INFO (searcherExecutor-1964-thread-1) [ ]
o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: external
[junit4] 2> 447420 INFO (searcherExecutor-1964-thread-1) [ ]
o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: freq
[junit4] 2> 447420 INFO
(SUITE-MBeansHandlerTest-seed#[BAAC66F7AAB169E2]-worker) [ ]
o.a.s.SolrTestCaseJ4 ####initCore end
[junit4] 2> 447423 INFO
(TEST-MBeansHandlerTest.testBackCompatNames-seed#[BAAC66F7AAB169E2]) [ ]
o.a.s.SolrTestCaseJ4 ###Starting testBackCompatNames
[junit4] 2> 447423 INFO (searcherExecutor-1964-thread-1) [ ]
o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: fqcn
[junit4] 2> 447424 INFO
(TEST-MBeansHandlerTest.testBackCompatNames-seed#[BAAC66F7AAB169E2]) [ ]
o.a.s.c.S.Request [collection1] webapp=null path=null
params={qt=/admin/mbeans&wt=xml} status=0 QTime=0
[junit4] 2> 447424 INFO (searcherExecutor-1964-thread-1) [ ]
o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: perDict
[junit4] 2> 447425 INFO (searcherExecutor-1964-thread-1) [ ]
o.a.s.c.SolrCore [collection1] Registered new searcher
Searcher@f27f24[collection1]
main{ExitableDirectoryReader(UninvertingDirectoryReader())}
[junit4] 2> 447430 INFO
(TEST-MBeansHandlerTest.testBackCompatNames-seed#[BAAC66F7AAB169E2]) [ ]
o.a.s.c.S.Request [collection1] webapp=null path=null
params={qt=/admin/mbeans&cat=QUERYHANDLER&wt=xml} status=0 QTime=0
[junit4] 2> 447431 INFO
(TEST-MBeansHandlerTest.testBackCompatNames-seed#[BAAC66F7AAB169E2]) [ ]
o.a.s.c.S.Request [collection1] webapp=null path=null
params={qt=/admin/mbeans&cat=UPDATE&wt=xml} status=0 QTime=0
[junit4] 2> 447432 INFO
(TEST-MBeansHandlerTest.testBackCompatNames-seed#[BAAC66F7AAB169E2]) [ ]
o.a.s.SolrTestCaseJ4 ###Ending testBackCompatNames
[junit4] 2> 447433 INFO
(TEST-MBeansHandlerTest.testDiff-seed#[BAAC66F7AAB169E2]) [ ]
o.a.s.SolrTestCaseJ4 ###Starting testDiff
[junit4] 2> 447438 INFO
(TEST-MBeansHandlerTest.testDiff-seed#[BAAC66F7AAB169E2]) [ ]
o.a.s.c.S.Request [collection1] webapp=null path=null
params={qt=/admin/mbeans&stats=true&wt=xml} status=0 QTime=4
[junit4] 2> 447463 INFO
(TEST-MBeansHandlerTest.testDiff-seed#[BAAC66F7AAB169E2]) [ ]
o.a.s.c.S.Request [collection1] webapp=null path=null
params={qt=/admin/mbeans&stats=true&diff=true&wt=xml} status=0 QTime=22
[junit4] 2> 447480 INFO
(TEST-MBeansHandlerTest.testDiff-seed#[BAAC66F7AAB169E2]) [ ]
o.a.s.SolrTestCaseJ4 ###Ending testDiff
[junit4] 2> NOTE: reproduce with: ant test -Dtestcase=MBeansHandlerTest
-Dtests.method=testDiff -Dtests.seed=BAAC66F7AAB169E2 -Dtests.multiplier=3
-Dtests.slow=true -Dtests.locale=en-MP -Dtests.timezone=Africa/Bissau
-Dtests.asserts=true -Dtests.file.encoding=US-ASCII
[junit4] FAILURE 0.05s J0 | MBeansHandlerTest.testDiff <<<
[junit4] > Throwable #1: org.junit.ComparisonFailure: expected:<Was: [1,
Now: 2], Delta: 1> but was:<Was: [4, Now: 5], Delta: 1>
[junit4] > at
__randomizedtesting.SeedInfo.seed([BAAC66F7AAB169E2:7FBAA26CBA075182]:0)
[junit4] > at
org.apache.solr.handler.admin.MBeansHandlerTest.testDiff(MBeansHandlerTest.java:63)
[junit4] > at
java.base/jdk.internal.reflect.NativeMethodAccessorImpl.invoke0(Native Method)
[junit4] > at
java.base/jdk.internal.reflect.NativeMethodAccessorImpl.invoke(NativeMethodAccessorImpl.java:62)
[junit4] > at
java.base/jdk.internal.reflect.DelegatingMethodAccessorImpl.invoke(DelegatingMethodAccessorImpl.java:43)
[junit4] > at
java.base/java.lang.reflect.Method.invoke(Method.java:543)
[junit4] > at java.base/java.lang.Thread.run(Thread.java:844)
[junit4] 2> 447484 INFO
(TEST-MBeansHandlerTest.testXMLDiffWithExternalEntity-seed#[BAAC66F7AAB169E2])
[ ] o.a.s.SolrTestCaseJ4 ###Starting testXMLDiffWithExternalEntity
[junit4] 2> 447504 INFO
(TEST-MBeansHandlerTest.testXMLDiffWithExternalEntity-seed#[BAAC66F7AAB169E2])
[ ] o.a.s.SolrTestCaseJ4 ###Ending testXMLDiffWithExternalEntity
[junit4] 2> 447504 INFO
(SUITE-MBeansHandlerTest-seed#[BAAC66F7AAB169E2]-worker) [ ]
o.a.s.SolrTestCaseJ4 ###deleteCore
[junit4] 2> 447504 INFO
(SUITE-MBeansHandlerTest-seed#[BAAC66F7AAB169E2]-worker) [ ]
o.a.s.c.CoreContainer Shutting down CoreContainer instance=3249524
[junit4] 2> 447504 INFO (coreCloseExecutor-1969-thread-1) [ ]
o.a.s.c.SolrCore [collection1] CLOSING SolrCore
org.apache.solr.core.SolrCore@11a7b72
[junit4] 2> 447548 INFO (coreCloseExecutor-1969-thread-1) [ ]
o.a.s.m.SolrMetricManager Closing metric reporters for: solr.core.collection1
[junit4] 2> 447553 INFO
(SUITE-MBeansHandlerTest-seed#[BAAC66F7AAB169E2]-worker) [ ]
o.a.s.m.SolrMetricManager Closing metric reporters for: solr.node
[junit4] 2> NOTE: leaving temporary files on disk at:
/home/jenkins/workspace/Lucene-Solr-6.x-Linux/solr/build/solr-core/test/J0/temp/solr.handler.admin.MBeansHandlerTest_BAAC66F7AAB169E2-001
[junit4] 2> NOTE: test params are: codec=Asserting(Lucene62): {},
docValues:{}, maxPointsInLeafNode=407, maxMBSortInHeap=6.845034922242407,
sim=RandomSimilarity(queryNorm=false,coord=no): {}, locale=en-MP,
timezone=Africa/Bissau
[junit4] 2> NOTE: Linux 4.4.0-53-generic i386/Oracle Corporation 9-ea
(32-bit)/cpus=12,threads=1,free=64444552,total=294248448
[junit4] 2> NOTE: All tests run in this JVM: [FastVectorHighlighterTest,
TestBinaryResponseWriter, DistributedVersionInfoTest,
TestPerFieldSimilarityClassic, SpatialHeatmapFacetsTest,
OverseerModifyCollectionTest, TestDefaultStatsCache, TestHdfsBackupRestoreCore,
HdfsChaosMonkeySafeLeaderTest, UniqFieldsUpdateProcessorFactoryTest, TestJoin,
DistributedQueryElevationComponentTest, TestUseDocValuesAsStored2,
RestartWhileUpdatingTest, TestMacros, PeerSyncTest, TestSchemaNameResource,
OverseerTaskQueueTest, TestDynamicFieldCollectionResource,
TestSolrQueryParserResource, DateFieldTest, SyncSliceTest, TestComponentsName,
TestDynamicLoading, CoreAdminRequestStatusTest,
LeaderFailureAfterFreshStartTest, ResourceLoaderTest,
DistributedFacetPivotSmallAdvancedTest, DisMaxRequestHandlerTest,
HdfsUnloadDistributedZkTest, UUIDFieldTest, TestDistribDocBasedVersion,
TestRuleBasedAuthorizationPlugin, CloneFieldUpdateProcessorFactoryTest,
TestRemoteStreaming, TestSolrCoreProperties,
OutOfBoxZkACLAndCredentialsProvidersTest, TestStressLiveNodes,
TestGraphTermsQParserPlugin, ZkNodePropsTest, SolrJmxReporterTest,
MetricsHandlerTest, DistributedQueryComponentCustomSortTest,
DataDrivenBlockJoinTest, MBeansHandlerTest]
[junit4] Completed [103/681 (2!)] on J0 in 0.84s, 3 tests, 1 failure <<<
FAILURES!
[...truncated 53433 lines...]
---------------------------------------------------------------------
To unsubscribe, e-mail: [email protected]
For additional commands, e-mail: [email protected]
