Build: https://builds.apache.org/job/Lucene-Solr-Tests-master/2303/
4 tests failed.
FAILED: org.apache.solr.cloud.FullSolrCloudDistribCmdsTest.test
Error Message:
Could not find collection:collection2
Stack Trace:
java.lang.AssertionError: Could not find collection:collection2
at
__randomizedtesting.SeedInfo.seed([43B9CF7079FA8FBB:CBEDF0AAD706E243]:0)
at org.junit.Assert.fail(Assert.java:93)
at org.junit.Assert.assertTrue(Assert.java:43)
at org.junit.Assert.assertNotNull(Assert.java:526)
at
org.apache.solr.cloud.AbstractDistribZkTestBase.waitForRecoveriesToFinish(AbstractDistribZkTestBase.java:155)
at
org.apache.solr.cloud.AbstractDistribZkTestBase.waitForRecoveriesToFinish(AbstractDistribZkTestBase.java:140)
at
org.apache.solr.cloud.AbstractDistribZkTestBase.waitForRecoveriesToFinish(AbstractDistribZkTestBase.java:135)
at
org.apache.solr.cloud.AbstractFullDistribZkTestBase.waitForRecoveriesToFinish(AbstractFullDistribZkTestBase.java:915)
at
org.apache.solr.cloud.FullSolrCloudDistribCmdsTest.testIndexingBatchPerRequestWithHttpSolrClient(FullSolrCloudDistribCmdsTest.java:612)
at
org.apache.solr.cloud.FullSolrCloudDistribCmdsTest.test(FullSolrCloudDistribCmdsTest.java:152)
at sun.reflect.NativeMethodAccessorImpl.invoke0(Native Method)
at
sun.reflect.NativeMethodAccessorImpl.invoke(NativeMethodAccessorImpl.java:62)
at
sun.reflect.DelegatingMethodAccessorImpl.invoke(DelegatingMethodAccessorImpl.java:43)
at java.lang.reflect.Method.invoke(Method.java:498)
at
com.carrotsearch.randomizedtesting.RandomizedRunner.invoke(RandomizedRunner.java:1737)
at
com.carrotsearch.randomizedtesting.RandomizedRunner$8.evaluate(RandomizedRunner.java:934)
at
com.carrotsearch.randomizedtesting.RandomizedRunner$9.evaluate(RandomizedRunner.java:970)
at
com.carrotsearch.randomizedtesting.RandomizedRunner$10.evaluate(RandomizedRunner.java:984)
at
org.apache.solr.BaseDistributedSearchTestCase$ShardsRepeatRule$ShardsFixedStatement.callStatement(BaseDistributedSearchTestCase.java:993)
at
org.apache.solr.BaseDistributedSearchTestCase$ShardsRepeatRule$ShardsStatement.evaluate(BaseDistributedSearchTestCase.java:968)
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:943)
at
com.carrotsearch.randomizedtesting.RandomizedRunner$5.evaluate(RandomizedRunner.java:829)
at
com.carrotsearch.randomizedtesting.RandomizedRunner$6.evaluate(RandomizedRunner.java:879)
at
com.carrotsearch.randomizedtesting.RandomizedRunner$7.evaluate(RandomizedRunner.java:890)
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
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.lang.Thread.run(Thread.java:748)
FAILED:
org.apache.solr.cloud.autoscaling.ComputePlanActionTest.testNodeWithMultipleReplicasLost
Error Message:
The operations computed by ComputePlanAction should not be null
SolrClientNodeStateProvider.DEBUG{AFTER_ACTION=[compute_plan, null],
BEFORE_ACTION=[compute_plan, null]}
Stack Trace:
java.lang.AssertionError: The operations computed by ComputePlanAction should
not be null SolrClientNodeStateProvider.DEBUG{AFTER_ACTION=[compute_plan,
null], BEFORE_ACTION=[compute_plan, null]}
at
__randomizedtesting.SeedInfo.seed([43B9CF7079FA8FBB:73792EF2F1886EE7]:0)
at org.junit.Assert.fail(Assert.java:93)
at org.junit.Assert.assertTrue(Assert.java:43)
at org.junit.Assert.assertNotNull(Assert.java:526)
at
org.apache.solr.cloud.autoscaling.ComputePlanActionTest.testNodeWithMultipleReplicasLost(ComputePlanActionTest.java:291)
at sun.reflect.NativeMethodAccessorImpl.invoke0(Native Method)
at
sun.reflect.NativeMethodAccessorImpl.invoke(NativeMethodAccessorImpl.java:62)
at
sun.reflect.DelegatingMethodAccessorImpl.invoke(DelegatingMethodAccessorImpl.java:43)
at java.lang.reflect.Method.invoke(Method.java:498)
at
com.carrotsearch.randomizedtesting.RandomizedRunner.invoke(RandomizedRunner.java:1737)
at
com.carrotsearch.randomizedtesting.RandomizedRunner$8.evaluate(RandomizedRunner.java:934)
at
com.carrotsearch.randomizedtesting.RandomizedRunner$9.evaluate(RandomizedRunner.java:970)
at
com.carrotsearch.randomizedtesting.RandomizedRunner$10.evaluate(RandomizedRunner.java:984)
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:943)
at
com.carrotsearch.randomizedtesting.RandomizedRunner$5.evaluate(RandomizedRunner.java:829)
at
com.carrotsearch.randomizedtesting.RandomizedRunner$6.evaluate(RandomizedRunner.java:879)
at
com.carrotsearch.randomizedtesting.RandomizedRunner$7.evaluate(RandomizedRunner.java:890)
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
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.lang.Thread.run(Thread.java:748)
FAILED:
org.apache.solr.cloud.autoscaling.HdfsAutoAddReplicasIntegrationTest.testSimple
Error Message:
Waiting for collection testSimple1 null Live Nodes: [127.0.0.1:39390_solr,
127.0.0.1:42687_solr] Last available state:
DocCollection(testSimple1//collections/testSimple1/state.json/15)={
"pullReplicas":"0", "replicationFactor":"2", "shards":{ "shard1":{
"range":"80000000-ffffffff", "state":"active", "replicas":{
"core_node3":{
"dataDir":"hdfs://localhost:60465/data/testSimple1/core_node3/data/",
"base_url":"https://127.0.0.1:42687/solr",
"node_name":"127.0.0.1:42687_solr", "type":"NRT",
"ulogDir":"hdfs://localhost:60465/data/testSimple1/core_node3/data/tlog",
"core":"testSimple1_shard1_replica_n1", "shared_storage":"true",
"state":"active"}, "core_node5":{
"dataDir":"hdfs://localhost:60465/data/testSimple1/core_node5/data/",
"base_url":"https://127.0.0.1:42687/solr",
"node_name":"127.0.0.1:42687_solr", "type":"NRT",
"ulogDir":"hdfs://localhost:60465/data/testSimple1/core_node5/data/tlog",
"core":"testSimple1_shard1_replica_n2", "shared_storage":"true",
"state":"active", "leader":"true"}}}, "shard2":{
"range":"0-7fffffff", "state":"active", "replicas":{
"core_node7":{
"dataDir":"hdfs://localhost:60465/data/testSimple1/core_node7/data/",
"base_url":"https://127.0.0.1:46898/solr",
"node_name":"127.0.0.1:46898_solr", "type":"NRT",
"ulogDir":"hdfs://localhost:60465/data/testSimple1/core_node7/data/tlog",
"core":"testSimple1_shard2_replica_n4", "shared_storage":"true",
"state":"down"}, "core_node8":{
"dataDir":"hdfs://localhost:60465/data/testSimple1/core_node8/data/",
"base_url":"https://127.0.0.1:42687/solr",
"node_name":"127.0.0.1:42687_solr", "type":"NRT",
"ulogDir":"hdfs://localhost:60465/data/testSimple1/core_node8/data/tlog",
"core":"testSimple1_shard2_replica_n6", "shared_storage":"true",
"state":"active", "leader":"true"}}}},
"router":{"name":"compositeId"}, "maxShardsPerNode":"2",
"autoAddReplicas":"true", "nrtReplicas":"2", "tlogReplicas":"0"}
Stack Trace:
java.lang.AssertionError: Waiting for collection testSimple1
null
Live Nodes: [127.0.0.1:39390_solr, 127.0.0.1:42687_solr]
Last available state:
DocCollection(testSimple1//collections/testSimple1/state.json/15)={
"pullReplicas":"0",
"replicationFactor":"2",
"shards":{
"shard1":{
"range":"80000000-ffffffff",
"state":"active",
"replicas":{
"core_node3":{
"dataDir":"hdfs://localhost:60465/data/testSimple1/core_node3/data/",
"base_url":"https://127.0.0.1:42687/solr",
"node_name":"127.0.0.1:42687_solr",
"type":"NRT",
"ulogDir":"hdfs://localhost:60465/data/testSimple1/core_node3/data/tlog",
"core":"testSimple1_shard1_replica_n1",
"shared_storage":"true",
"state":"active"},
"core_node5":{
"dataDir":"hdfs://localhost:60465/data/testSimple1/core_node5/data/",
"base_url":"https://127.0.0.1:42687/solr",
"node_name":"127.0.0.1:42687_solr",
"type":"NRT",
"ulogDir":"hdfs://localhost:60465/data/testSimple1/core_node5/data/tlog",
"core":"testSimple1_shard1_replica_n2",
"shared_storage":"true",
"state":"active",
"leader":"true"}}},
"shard2":{
"range":"0-7fffffff",
"state":"active",
"replicas":{
"core_node7":{
"dataDir":"hdfs://localhost:60465/data/testSimple1/core_node7/data/",
"base_url":"https://127.0.0.1:46898/solr",
"node_name":"127.0.0.1:46898_solr",
"type":"NRT",
"ulogDir":"hdfs://localhost:60465/data/testSimple1/core_node7/data/tlog",
"core":"testSimple1_shard2_replica_n4",
"shared_storage":"true",
"state":"down"},
"core_node8":{
"dataDir":"hdfs://localhost:60465/data/testSimple1/core_node8/data/",
"base_url":"https://127.0.0.1:42687/solr",
"node_name":"127.0.0.1:42687_solr",
"type":"NRT",
"ulogDir":"hdfs://localhost:60465/data/testSimple1/core_node8/data/tlog",
"core":"testSimple1_shard2_replica_n6",
"shared_storage":"true",
"state":"active",
"leader":"true"}}}},
"router":{"name":"compositeId"},
"maxShardsPerNode":"2",
"autoAddReplicas":"true",
"nrtReplicas":"2",
"tlogReplicas":"0"}
at
__randomizedtesting.SeedInfo.seed([43B9CF7079FA8FBB:7B0AEB8E5E095B6A]:0)
at org.junit.Assert.fail(Assert.java:93)
at
org.apache.solr.cloud.SolrCloudTestCase.waitForState(SolrCloudTestCase.java:269)
at
org.apache.solr.cloud.autoscaling.AutoAddReplicasIntegrationTest.testSimple(AutoAddReplicasIntegrationTest.java:103)
at sun.reflect.NativeMethodAccessorImpl.invoke0(Native Method)
at
sun.reflect.NativeMethodAccessorImpl.invoke(NativeMethodAccessorImpl.java:62)
at
sun.reflect.DelegatingMethodAccessorImpl.invoke(DelegatingMethodAccessorImpl.java:43)
at java.lang.reflect.Method.invoke(Method.java:498)
at
com.carrotsearch.randomizedtesting.RandomizedRunner.invoke(RandomizedRunner.java:1737)
at
com.carrotsearch.randomizedtesting.RandomizedRunner$8.evaluate(RandomizedRunner.java:934)
at
com.carrotsearch.randomizedtesting.RandomizedRunner$9.evaluate(RandomizedRunner.java:970)
at
com.carrotsearch.randomizedtesting.RandomizedRunner$10.evaluate(RandomizedRunner.java:984)
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:943)
at
com.carrotsearch.randomizedtesting.RandomizedRunner$5.evaluate(RandomizedRunner.java:829)
at
com.carrotsearch.randomizedtesting.RandomizedRunner$6.evaluate(RandomizedRunner.java:879)
at
com.carrotsearch.randomizedtesting.RandomizedRunner$7.evaluate(RandomizedRunner.java:890)
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
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.lang.Thread.run(Thread.java:748)
FAILED: org.apache.solr.handler.admin.AutoscalingHistoryHandlerTest.testHistory
Error Message:
expected:<5> but was:<0>
Stack Trace:
java.lang.AssertionError: expected:<5> but was:<0>
at
__randomizedtesting.SeedInfo.seed([43B9CF7079FA8FBB:2E456B8DC3B270BC]:0)
at org.junit.Assert.fail(Assert.java:93)
at org.junit.Assert.failNotEquals(Assert.java:647)
at org.junit.Assert.assertEquals(Assert.java:128)
at org.junit.Assert.assertEquals(Assert.java:472)
at org.junit.Assert.assertEquals(Assert.java:456)
at
org.apache.solr.handler.admin.AutoscalingHistoryHandlerTest.testHistory(AutoscalingHistoryHandlerTest.java:274)
at sun.reflect.NativeMethodAccessorImpl.invoke0(Native Method)
at
sun.reflect.NativeMethodAccessorImpl.invoke(NativeMethodAccessorImpl.java:62)
at
sun.reflect.DelegatingMethodAccessorImpl.invoke(DelegatingMethodAccessorImpl.java:43)
at java.lang.reflect.Method.invoke(Method.java:498)
at
com.carrotsearch.randomizedtesting.RandomizedRunner.invoke(RandomizedRunner.java:1737)
at
com.carrotsearch.randomizedtesting.RandomizedRunner$8.evaluate(RandomizedRunner.java:934)
at
com.carrotsearch.randomizedtesting.RandomizedRunner$9.evaluate(RandomizedRunner.java:970)
at
com.carrotsearch.randomizedtesting.RandomizedRunner$10.evaluate(RandomizedRunner.java:984)
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:943)
at
com.carrotsearch.randomizedtesting.RandomizedRunner$5.evaluate(RandomizedRunner.java:829)
at
com.carrotsearch.randomizedtesting.RandomizedRunner$6.evaluate(RandomizedRunner.java:879)
at
com.carrotsearch.randomizedtesting.RandomizedRunner$7.evaluate(RandomizedRunner.java:890)
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
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.lang.Thread.run(Thread.java:748)
Build Log:
[...truncated 12556 lines...]
[junit4] Suite: org.apache.solr.cloud.autoscaling.ComputePlanActionTest
[junit4] 2> Creating dataDir:
/x1/jenkins/jenkins-slave/workspace/Lucene-Solr-Tests-master/solr/build/solr-core/test/J1/temp/solr.cloud.autoscaling.ComputePlanActionTest_43B9CF7079FA8FBB-001/init-core-data-001
[junit4] 2> 486439 WARN
(SUITE-ComputePlanActionTest-seed#[43B9CF7079FA8FBB]-worker) [ ]
o.a.s.SolrTestCaseJ4 startTrackingSearchers: numOpens=4 numCloses=4
[junit4] 2> 486439 INFO
(SUITE-ComputePlanActionTest-seed#[43B9CF7079FA8FBB]-worker) [ ]
o.a.s.SolrTestCaseJ4 Using PointFields (NUMERIC_POINTS_SYSPROP=true)
w/NUMERIC_DOCVALUES_SYSPROP=false
[junit4] 2> 486441 INFO
(SUITE-ComputePlanActionTest-seed#[43B9CF7079FA8FBB]-worker) [ ]
o.a.s.SolrTestCaseJ4 Randomized ssl (true) and clientAuth (true) via:
@org.apache.solr.util.RandomizeSSL(reason=, ssl=NaN, value=NaN, clientAuth=NaN)
[junit4] 2> 486442 INFO
(SUITE-ComputePlanActionTest-seed#[43B9CF7079FA8FBB]-worker) [ ]
o.a.s.SolrTestCaseJ4 SecureRandom sanity checks:
test.solr.allowed.securerandom=null & java.security.egd=file:/dev/./urandom
[junit4] 2> 486443 INFO
(SUITE-ComputePlanActionTest-seed#[43B9CF7079FA8FBB]-worker) [ ]
o.a.s.c.MiniSolrCloudCluster Starting cluster of 1 servers in
/x1/jenkins/jenkins-slave/workspace/Lucene-Solr-Tests-master/solr/build/solr-core/test/J1/temp/solr.cloud.autoscaling.ComputePlanActionTest_43B9CF7079FA8FBB-001/tempDir-001
[junit4] 2> 486443 INFO
(SUITE-ComputePlanActionTest-seed#[43B9CF7079FA8FBB]-worker) [ ]
o.a.s.c.ZkTestServer STARTING ZK TEST SERVER
[junit4] 2> 486443 INFO (Thread-494) [ ] o.a.s.c.ZkTestServer client
port:0.0.0.0/0.0.0.0:0
[junit4] 2> 486443 INFO (Thread-494) [ ] o.a.s.c.ZkTestServer Starting
server
[junit4] 2> 486447 ERROR (Thread-494) [ ] o.a.z.s.ZooKeeperServer
ZKShutdownHandler is not registered, so ZooKeeper server won't take any action
on ERROR or SHUTDOWN server state changes
[junit4] 2> 486543 INFO
(SUITE-ComputePlanActionTest-seed#[43B9CF7079FA8FBB]-worker) [ ]
o.a.s.c.ZkTestServer start zk server on port:45473
[junit4] 2> 486548 INFO (zkConnectionManagerCallback-898-thread-1) [ ]
o.a.s.c.c.ConnectionManager zkClient has connected
[junit4] 2> 486552 INFO (jetty-launcher-895-thread-1) [ ]
o.e.j.s.Server jetty-9.4.8.v20171121, build timestamp:
2017-11-22T00:27:37+03:00, git hash: 82b8fb23f757335bb3329d540ce37a2a2615f0a8
[junit4] 2> 486553 INFO (jetty-launcher-895-thread-1) [ ]
o.e.j.s.session DefaultSessionIdManager workerName=node0
[junit4] 2> 486553 INFO (jetty-launcher-895-thread-1) [ ]
o.e.j.s.session No SessionScavenger set, using defaults
[junit4] 2> 486553 INFO (jetty-launcher-895-thread-1) [ ]
o.e.j.s.session Scavenging every 660000ms
[junit4] 2> 486554 INFO (jetty-launcher-895-thread-1) [ ]
o.e.j.s.h.ContextHandler Started
o.e.j.s.ServletContextHandler@637db8de{/solr,null,AVAILABLE}
[junit4] 2> 486557 INFO (jetty-launcher-895-thread-1) [ ]
o.e.j.s.AbstractConnector Started ServerConnector@1c0a284d{SSL,[ssl,
http/1.1]}{127.0.0.1:39407}
[junit4] 2> 486557 INFO (jetty-launcher-895-thread-1) [ ]
o.e.j.s.Server Started @488772ms
[junit4] 2> 486557 INFO (jetty-launcher-895-thread-1) [ ]
o.a.s.c.s.e.JettySolrRunner Jetty properties: {hostContext=/solr,
hostPort=39407}
[junit4] 2> 486558 ERROR (jetty-launcher-895-thread-1) [ ]
o.a.s.u.StartupLoggingUtils Missing Java Option solr.log.dir. Logging may be
missing or incomplete.
[junit4] 2> 486558 INFO (jetty-launcher-895-thread-1) [ ]
o.a.s.s.SolrDispatchFilter ___ _ Welcome to Apache Solr? version
8.0.0
[junit4] 2> 486558 INFO (jetty-launcher-895-thread-1) [ ]
o.a.s.s.SolrDispatchFilter / __| ___| |_ _ Starting in cloud mode on port null
[junit4] 2> 486558 INFO (jetty-launcher-895-thread-1) [ ]
o.a.s.s.SolrDispatchFilter \__ \/ _ \ | '_| Install dir: null
[junit4] 2> 486558 INFO (jetty-launcher-895-thread-1) [ ]
o.a.s.s.SolrDispatchFilter |___/\___/_|_| Start time:
2018-02-10T08:05:31.185Z
[junit4] 2> 486561 INFO (zkConnectionManagerCallback-900-thread-1) [ ]
o.a.s.c.c.ConnectionManager zkClient has connected
[junit4] 2> 486561 INFO (jetty-launcher-895-thread-1) [ ]
o.a.s.s.SolrDispatchFilter solr.xml found in ZooKeeper. Loading...
[junit4] 2> 486582 INFO (jetty-launcher-895-thread-1) [ ]
o.a.s.c.ZkContainer Zookeeper client=127.0.0.1:45473/solr
[junit4] 2> 486583 INFO (zkConnectionManagerCallback-904-thread-1) [ ]
o.a.s.c.c.ConnectionManager zkClient has connected
[junit4] 2> 486595 INFO
(zkConnectionManagerCallback-906-thread-1-processing-n:127.0.0.1:39407_solr)
[n:127.0.0.1:39407_solr ] o.a.s.c.c.ConnectionManager zkClient has connected
[junit4] 2> 486719 INFO (jetty-launcher-895-thread-1)
[n:127.0.0.1:39407_solr ] o.a.s.c.Overseer Overseer (id=null) closing
[junit4] 2> 486720 INFO (jetty-launcher-895-thread-1)
[n:127.0.0.1:39407_solr ] o.a.s.c.OverseerElectionContext I am going to be
the leader 127.0.0.1:39407_solr
[junit4] 2> 486720 INFO (jetty-launcher-895-thread-1)
[n:127.0.0.1:39407_solr ] o.a.s.c.Overseer Overseer
(id=73270130737807363-127.0.0.1:39407_solr-n_0000000000) starting
[junit4] 2> 486725 DEBUG
(OverseerStateUpdate-73270130737807363-127.0.0.1:39407_solr-n_0000000000)
[n:127.0.0.1:39407_solr ] o.a.s.c.Overseer Starting to work on the main queue
[junit4] 2> 486726 INFO (jetty-launcher-895-thread-1)
[n:127.0.0.1:39407_solr ] o.a.s.c.ZkController Register node as live in
ZooKeeper:/live_nodes/127.0.0.1:39407_solr
[junit4] 2> 486726 DEBUG
(OverseerAutoScalingTriggerThread-73270130737807363-127.0.0.1:39407_solr-n_0000000000)
[n:127.0.0.1:39407_solr ] o.a.s.c.a.OverseerTriggerThread Adding
.autoAddReplicas trigger
[junit4] 2> 486726 DEBUG
(OverseerAutoScalingTriggerThread-73270130737807363-127.0.0.1:39407_solr-n_0000000000)
[n:127.0.0.1:39407_solr ] o.a.s.c.a.OverseerTriggerThread Refreshing
/autoscaling.json with znode version 1
[junit4] 2> 486727 INFO
(OverseerStateUpdate-73270130737807363-127.0.0.1:39407_solr-n_0000000000)
[n:127.0.0.1:39407_solr ] o.a.s.c.c.ZkStateReader Updated live nodes from
ZooKeeper... (0) -> (1)
[junit4] 2> 486727 DEBUG
(OverseerAutoScalingTriggerThread-73270130737807363-127.0.0.1:39407_solr-n_0000000000)
[n:127.0.0.1:39407_solr ] o.a.s.c.a.NodeLostTrigger Initial livenodes:
[127.0.0.1:39407_solr]
[junit4] 2> 486727 DEBUG
(OverseerAutoScalingTriggerThread-73270130737807363-127.0.0.1:39407_solr-n_0000000000)
[n:127.0.0.1:39407_solr ] o.a.s.c.a.OverseerTriggerThread Current
znodeVersion 1, lastZnodeVersion -1
[junit4] 2> 486727 DEBUG
(OverseerAutoScalingTriggerThread-73270130737807363-127.0.0.1:39407_solr-n_0000000000)
[n:127.0.0.1:39407_solr ] o.a.s.c.a.OverseerTriggerThread Processed trigger
updates upto znodeVersion 1
[junit4] 2> 486731 DEBUG
(OverseerAutoScalingTriggerThread-73270130737807363-127.0.0.1:39407_solr-n_0000000000)
[n:127.0.0.1:39407_solr ] o.a.s.c.a.OverseerTriggerThread -- clean old
nodeAdded markers
[junit4] 2> 486731 DEBUG
(OverseerAutoScalingTriggerThread-73270130737807363-127.0.0.1:39407_solr-n_0000000000)
[n:127.0.0.1:39407_solr ] o.a.s.c.a.OverseerTriggerThread Current
znodeVersion 1, lastZnodeVersion 1
[junit4] 2> 486731 DEBUG (ScheduledTrigger-1140-thread-1)
[n:127.0.0.1:39407_solr ] o.a.s.c.a.NodeLostTrigger Running NodeLostTrigger:
.auto_add_replicas with currently live nodes: 1
[junit4] 2> 486772 INFO (jetty-launcher-895-thread-1)
[n:127.0.0.1:39407_solr ] o.a.s.m.r.SolrJmxReporter JMX monitoring for
'solr_39407.solr.node' (registry 'solr.node') enabled at server:
com.sun.jmx.mbeanserver.JmxMBeanServer@7bb3a730
[junit4] 2> 486779 INFO (jetty-launcher-895-thread-1)
[n:127.0.0.1:39407_solr ] o.a.s.m.r.SolrJmxReporter JMX monitoring for
'solr_39407.solr.jvm' (registry 'solr.jvm') enabled at server:
com.sun.jmx.mbeanserver.JmxMBeanServer@7bb3a730
[junit4] 2> 486779 INFO (jetty-launcher-895-thread-1)
[n:127.0.0.1:39407_solr ] o.a.s.m.r.SolrJmxReporter JMX monitoring for
'solr_39407.solr.jetty' (registry 'solr.jetty') enabled at server:
com.sun.jmx.mbeanserver.JmxMBeanServer@7bb3a730
[junit4] 2> 486780 INFO (jetty-launcher-895-thread-1)
[n:127.0.0.1:39407_solr ] o.a.s.c.CorePropertiesLocator Found 0 core
definitions underneath
/x1/jenkins/jenkins-slave/workspace/Lucene-Solr-Tests-master/solr/build/solr-core/test/J1/temp/solr.cloud.autoscaling.ComputePlanActionTest_43B9CF7079FA8FBB-001/tempDir-001/node1/.
[junit4] 2> 486793 INFO (zkConnectionManagerCallback-910-thread-1) [ ]
o.a.s.c.c.ConnectionManager zkClient has connected
[junit4] 2> 486796 INFO (zkConnectionManagerCallback-914-thread-1) [ ]
o.a.s.c.c.ConnectionManager zkClient has connected
[junit4] 2> 486797 INFO
(SUITE-ComputePlanActionTest-seed#[43B9CF7079FA8FBB]-worker) [ ]
o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (0) -> (1)
[junit4] 2> 486797 INFO
(SUITE-ComputePlanActionTest-seed#[43B9CF7079FA8FBB]-worker) [ ]
o.a.s.c.s.i.ZkClientClusterStateProvider Cluster at 127.0.0.1:45473/solr ready
[junit4] 2> 486807 INFO
(TEST-ComputePlanActionTest.testNodeAdded-seed#[43B9CF7079FA8FBB]) [ ]
o.a.s.SolrTestCaseJ4 ###Starting testNodeAdded
[junit4] 2> 486808 DEBUG
(zkCallback-905-thread-1-processing-n:127.0.0.1:39407_solr)
[n:127.0.0.1:39407_solr ] o.a.s.c.a.OverseerTriggerThread Refreshing
/autoscaling.json with znode version 2
[junit4] 2> 486808 DEBUG
(OverseerAutoScalingTriggerThread-73270130737807363-127.0.0.1:39407_solr-n_0000000000)
[n:127.0.0.1:39407_solr ] o.a.s.c.a.OverseerTriggerThread Processed trigger
updates upto znodeVersion 2
[junit4] 2> 486811 INFO
(TEST-ComputePlanActionTest.testNodeAdded-seed#[43B9CF7079FA8FBB]) [ ]
o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (0) -> (1)
[junit4] 2> 486812 DEBUG
(OverseerAutoScalingTriggerThread-73270130737807363-127.0.0.1:39407_solr-n_0000000000)
[n:127.0.0.1:39407_solr ] o.a.s.c.a.OverseerTriggerThread -- clean old
nodeLost markers
[junit4] 2> 486818 DEBUG
(OverseerAutoScalingTriggerThread-73270130737807363-127.0.0.1:39407_solr-n_0000000000)
[n:127.0.0.1:39407_solr ] o.a.s.c.a.OverseerTriggerThread -- clean old
nodeAdded markers
[junit4] 2> 486819 DEBUG
(OverseerAutoScalingTriggerThread-73270130737807363-127.0.0.1:39407_solr-n_0000000000)
[n:127.0.0.1:39407_solr ] o.a.s.c.a.OverseerTriggerThread Current
znodeVersion 2, lastZnodeVersion 2
[junit4] 2> 486862 INFO (qtp1590159348-3378) [n:127.0.0.1:39407_solr ]
o.a.s.s.HttpSolrCall [admin] webapp=null path=/admin/metrics
params={prefix=CONTAINER.fs.usableSpace,CORE.coreName&wt=javabin&version=2&group=solr.node,solr.core}
status=0 QTime=0
[junit4] 2> 486864 DEBUG (qtp1590159348-3374) [n:127.0.0.1:39407_solr ]
o.a.s.c.a.AutoScalingHandler Verified autoscaling configuration
[junit4] 2> 486887 INFO (qtp1590159348-3374) [n:127.0.0.1:39407_solr ]
o.a.s.s.HttpSolrCall [admin] webapp=null path=/cluster/autoscaling
params={wt=javabin&version=2} status=0 QTime=36
[junit4] 2> 486887 DEBUG
(zkCallback-905-thread-1-processing-n:127.0.0.1:39407_solr)
[n:127.0.0.1:39407_solr ] o.a.s.c.a.OverseerTriggerThread Refreshing
/autoscaling.json with znode version 3
[junit4] 2> 486887 DEBUG
(OverseerAutoScalingTriggerThread-73270130737807363-127.0.0.1:39407_solr-n_0000000000)
[n:127.0.0.1:39407_solr ] o.a.s.c.a.OverseerTriggerThread Processed trigger
updates upto znodeVersion 3
[junit4] 2> 486887 DEBUG
(OverseerAutoScalingTriggerThread-73270130737807363-127.0.0.1:39407_solr-n_0000000000)
[n:127.0.0.1:39407_solr ] o.a.s.c.a.OverseerTriggerThread -- clean old
nodeLost markers
[junit4] 2> 486887 DEBUG
(OverseerAutoScalingTriggerThread-73270130737807363-127.0.0.1:39407_solr-n_0000000000)
[n:127.0.0.1:39407_solr ] o.a.s.c.a.OverseerTriggerThread -- clean old
nodeAdded markers
[junit4] 2> 486887 DEBUG
(OverseerAutoScalingTriggerThread-73270130737807363-127.0.0.1:39407_solr-n_0000000000)
[n:127.0.0.1:39407_solr ] o.a.s.c.a.OverseerTriggerThread Current
znodeVersion 3, lastZnodeVersion 3
[junit4] 2> 486890 INFO (qtp1590159348-3377) [n:127.0.0.1:39407_solr ]
o.a.s.s.HttpSolrCall [admin] webapp=null path=/admin/metrics
params={prefix=CONTAINER.fs.usableSpace,CORE.coreName&wt=javabin&version=2&group=solr.node,solr.core}
status=0 QTime=0
[junit4] 2> 486890 DEBUG (qtp1590159348-3376) [n:127.0.0.1:39407_solr ]
o.a.s.c.a.AutoScalingHandler Verified autoscaling configuration
[junit4] 2> 486890 INFO (qtp1590159348-3376) [n:127.0.0.1:39407_solr ]
o.a.s.s.HttpSolrCall [admin] webapp=null path=/cluster/autoscaling
params={wt=javabin&version=2} status=0 QTime=3
[junit4] 2> 486890 DEBUG
(zkCallback-905-thread-1-processing-n:127.0.0.1:39407_solr)
[n:127.0.0.1:39407_solr ] o.a.s.c.a.OverseerTriggerThread Refreshing
/autoscaling.json with znode version 4
[junit4] 2> 486891 DEBUG
(OverseerAutoScalingTriggerThread-73270130737807363-127.0.0.1:39407_solr-n_0000000000)
[n:127.0.0.1:39407_solr ] o.a.s.c.a.OverseerTriggerThread Processed trigger
updates upto znodeVersion 4
[junit4] 2> 486891 DEBUG
(OverseerAutoScalingTriggerThread-73270130737807363-127.0.0.1:39407_solr-n_0000000000)
[n:127.0.0.1:39407_solr ] o.a.s.c.a.OverseerTriggerThread -- clean old
nodeLost markers
[junit4] 2> 486891 DEBUG
(OverseerAutoScalingTriggerThread-73270130737807363-127.0.0.1:39407_solr-n_0000000000)
[n:127.0.0.1:39407_solr ] o.a.s.c.a.OverseerTriggerThread -- clean old
nodeAdded markers
[junit4] 2> 486891 DEBUG
(OverseerAutoScalingTriggerThread-73270130737807363-127.0.0.1:39407_solr-n_0000000000)
[n:127.0.0.1:39407_solr ] o.a.s.c.a.OverseerTriggerThread Current
znodeVersion 4, lastZnodeVersion 4
[junit4] 2> 486906 INFO (qtp1590159348-3378) [n:127.0.0.1:39407_solr ]
o.a.s.s.HttpSolrCall [admin] webapp=null path=/admin/metrics
params={prefix=CONTAINER.fs.usableSpace,CORE.coreName&wt=javabin&version=2&group=solr.node,solr.core}
status=0 QTime=0
[junit4] 2> 486906 DEBUG (qtp1590159348-3374) [n:127.0.0.1:39407_solr ]
o.a.s.c.a.AutoScalingHandler Verified autoscaling configuration
[junit4] 2> 486907 INFO (qtp1590159348-3374) [n:127.0.0.1:39407_solr ]
o.a.s.s.HttpSolrCall [admin] webapp=null path=/cluster/autoscaling
params={wt=javabin&version=2} status=0 QTime=14
[junit4] 2> 486907 DEBUG
(zkCallback-905-thread-1-processing-n:127.0.0.1:39407_solr)
[n:127.0.0.1:39407_solr ] o.a.s.c.a.OverseerTriggerThread Refreshing
/autoscaling.json with znode version 5
[junit4] 2> 486909 DEBUG
(zkCallback-905-thread-1-processing-n:127.0.0.1:39407_solr)
[n:127.0.0.1:39407_solr ] o.a.s.c.a.NodeAddedTrigger Initial livenodes:
[127.0.0.1:39407_solr]
[junit4] 2> 486909 DEBUG
(zkCallback-905-thread-1-processing-n:127.0.0.1:39407_solr)
[n:127.0.0.1:39407_solr ] o.a.s.c.a.NodeAddedTrigger NodeAddedTrigger
node_added_trigger instantiated with properties: {event=nodeAdded, waitFor=1,
actions=[{name=compute_plan, class=solr.ComputePlanAction}, {name=test,
class=org.apache.solr.cloud.autoscaling.ComputePlanActionTest$AssertingTriggerAction}],
enabled=true}
[junit4] 2> 486909 DEBUG
(OverseerAutoScalingTriggerThread-73270130737807363-127.0.0.1:39407_solr-n_0000000000)
[n:127.0.0.1:39407_solr ] o.a.s.c.a.OverseerTriggerThread Processed trigger
updates upto znodeVersion 5
[junit4] 2> 486910 INFO (qtp1590159348-3377) [n:127.0.0.1:39407_solr ]
o.a.s.s.HttpSolrCall [admin] webapp=null path=/admin/metrics
params={prefix=CONTAINER.fs.usableSpace,CORE.coreName&wt=javabin&version=2&group=solr.node,solr.core}
status=0 QTime=0
[junit4] 2> 486910 DEBUG (qtp1590159348-3376) [n:127.0.0.1:39407_solr ]
o.a.s.c.a.AutoScalingHandler Verified autoscaling configuration
[junit4] 2> 486910 INFO (qtp1590159348-3376) [n:127.0.0.1:39407_solr ]
o.a.s.s.HttpSolrCall [admin] webapp=null path=/admin/autoscaling
params={wt=javabin&version=2} status=0 QTime=2
[junit4] 2> 486911 DEBUG
(zkCallback-905-thread-1-processing-n:127.0.0.1:39407_solr)
[n:127.0.0.1:39407_solr ] o.a.s.c.a.OverseerTriggerThread Refreshing
/autoscaling.json with znode version 6
[junit4] 2> 486911 INFO (qtp1590159348-3374) [n:127.0.0.1:39407_solr ]
o.a.s.h.a.CollectionsHandler Invoked Collection Action :create with params
replicationFactor=2&collection.configName=conf&name=testNodeAdded&nrtReplicas=2&action=CREATE&numShards=1&wt=javabin&version=2
and sendToOCPQueue=true
[junit4] 2> 486911 DEBUG
(zkCallback-905-thread-1-processing-n:127.0.0.1:39407_solr)
[n:127.0.0.1:39407_solr ] o.a.s.c.a.NodeAddedTrigger Initial livenodes:
[127.0.0.1:39407_solr]
[junit4] 2> 486911 DEBUG
(zkCallback-905-thread-1-processing-n:127.0.0.1:39407_solr)
[n:127.0.0.1:39407_solr ] o.a.s.c.a.NodeAddedTrigger NodeAddedTrigger
node_added_trigger instantiated with properties: {event=nodeAdded, waitFor=1,
actions=[{name=compute_plan, class=solr.ComputePlanAction}, {name=test,
class=org.apache.solr.cloud.autoscaling.ComputePlanActionTest$AssertingTriggerAction}],
enabled=true}
[junit4] 2> 486911 DEBUG
(OverseerAutoScalingTriggerThread-73270130737807363-127.0.0.1:39407_solr-n_0000000000)
[n:127.0.0.1:39407_solr ] o.a.s.c.a.OverseerTriggerThread -- clean old
nodeLost markers
[junit4] 2> 486911 DEBUG
(OverseerAutoScalingTriggerThread-73270130737807363-127.0.0.1:39407_solr-n_0000000000)
[n:127.0.0.1:39407_solr ] o.a.s.c.a.OverseerTriggerThread Current
znodeVersion 6, lastZnodeVersion 5
[junit4] 2> 486911 DEBUG
(OverseerAutoScalingTriggerThread-73270130737807363-127.0.0.1:39407_solr-n_0000000000)
[n:127.0.0.1:39407_solr ] o.a.s.c.a.OverseerTriggerThread Processed trigger
updates upto znodeVersion 6
[junit4] 2> 486912 DEBUG (ScheduledTrigger-1140-thread-1)
[n:127.0.0.1:39407_solr ] o.a.s.c.a.NodeAddedTrigger Running
NodeAddedTrigger node_added_trigger
[junit4] 2> 486912 DEBUG (ScheduledTrigger-1140-thread-1)
[n:127.0.0.1:39407_solr ] o.a.s.c.a.NodeAddedTrigger Found livenodes: 1
[junit4] 2> 486912 DEBUG
(OverseerAutoScalingTriggerThread-73270130737807363-127.0.0.1:39407_solr-n_0000000000)
[n:127.0.0.1:39407_solr ] o.a.s.c.a.OverseerTriggerThread -- clean old
nodeLost markers
[junit4] 2> 486912 DEBUG
(OverseerAutoScalingTriggerThread-73270130737807363-127.0.0.1:39407_solr-n_0000000000)
[n:127.0.0.1:39407_solr ] o.a.s.c.a.OverseerTriggerThread Current
znodeVersion 6, lastZnodeVersion 6
[junit4] 2> 486913 INFO
(OverseerThreadFactory-1142-thread-1-processing-n:127.0.0.1:39407_solr)
[n:127.0.0.1:39407_solr ] o.a.s.c.a.c.CreateCollectionCmd Create collection
testNodeAdded
[junit4] 2> 486913 WARN
(OverseerThreadFactory-1142-thread-1-processing-n:127.0.0.1:39407_solr)
[n:127.0.0.1:39407_solr ] o.a.s.c.a.c.CreateCollectionCmd Specified number
of replicas of 2 on collection testNodeAdded is higher than the number of Solr
instances currently live or live and part of your createNodeSet(1). It's
unusual to run two replica of the same slice on the same Solr-instance.
[junit4] 2> 486919 INFO (qtp1590159348-3378) [n:127.0.0.1:39407_solr ]
o.a.s.s.HttpSolrCall [admin] webapp=null path=/admin/metrics
params={prefix=CONTAINER.fs.usableSpace,CORE.coreName&wt=javabin&version=2&group=solr.node,solr.core}
status=0 QTime=0
[junit4] 2> 486925 INFO
(OverseerThreadFactory-1142-thread-1-processing-n:127.0.0.1:39407_solr)
[n:127.0.0.1:39407_solr ] o.a.s.c.s.c.a.PolicyHelper returnSession,
curr-time 18501842215 sessionWrapper.createTime 18501842209964942,
this.sessionWrapper.createTime 18501842209964942
[junit4] 2> 486933 DEBUG
(OverseerStateUpdate-73270130737807363-127.0.0.1:39407_solr-n_0000000000)
[n:127.0.0.1:39407_solr ] o.a.s.c.Overseer processMessage: queueSize: 1,
message = {
[junit4] 2> "name":"testNodeAdded",
[junit4] 2> "fromApi":"true",
[junit4] 2> "replicationFactor":"2",
[junit4] 2> "collection.configName":"conf",
[junit4] 2> "numShards":"1",
[junit4] 2> "nrtReplicas":"2",
[junit4] 2> "stateFormat":"2",
[junit4] 2> "operation":"create"} current state version: 0
[junit4] 2> 486933 DEBUG
(OverseerStateUpdate-73270130737807363-127.0.0.1:39407_solr-n_0000000000)
[n:127.0.0.1:39407_solr ] o.a.s.c.o.ClusterStateMutator building a new
cName: testNodeAdded
[junit4] 2> 486934 DEBUG
(OverseerStateUpdate-73270130737807363-127.0.0.1:39407_solr-n_0000000000)
[n:127.0.0.1:39407_solr ] o.a.s.c.o.ZkStateWriter going to create_collection
/collections/testNodeAdded/state.json
[junit4] 2> 487036 DEBUG
(OverseerStateUpdate-73270130737807363-127.0.0.1:39407_solr-n_0000000000)
[n:127.0.0.1:39407_solr ] o.a.s.c.Overseer processMessage: queueSize: 1,
message = {
[junit4] 2> "operation":"ADDREPLICA",
[junit4] 2> "collection":"testNodeAdded",
[junit4] 2> "shard":"shard1",
[junit4] 2> "core":"testNodeAdded_shard1_replica_n1",
[junit4] 2> "state":"down",
[junit4] 2> "base_url":"https://127.0.0.1:39407/solr",
[junit4] 2> "type":"NRT",
[junit4] 2> "waitForFinalState":"false"} current state version: 0
[junit4] 2> 487036 INFO
(OverseerStateUpdate-73270130737807363-127.0.0.1:39407_solr-n_0000000000)
[n:127.0.0.1:39407_solr ] o.a.s.c.o.SliceMutator createReplica() {
[junit4] 2> "operation":"ADDREPLICA",
[junit4] 2> "collection":"testNodeAdded",
[junit4] 2> "shard":"shard1",
[junit4] 2> "core":"testNodeAdded_shard1_replica_n1",
[junit4] 2> "state":"down",
[junit4] 2> "base_url":"https://127.0.0.1:39407/solr",
[junit4] 2> "type":"NRT",
[junit4] 2> "waitForFinalState":"false"}
[junit4] 2> 487037 DEBUG
(OverseerStateUpdate-73270130737807363-127.0.0.1:39407_solr-n_0000000000)
[n:127.0.0.1:39407_solr ] o.a.s.c.o.SliceMutator Old Slice: shard1:{
[junit4] 2> "range":"80000000-7fffffff",
[junit4] 2> "state":"active",
[junit4] 2> "replicas":{}}
[junit4] 2> 487037 DEBUG
(OverseerStateUpdate-73270130737807363-127.0.0.1:39407_solr-n_0000000000)
[n:127.0.0.1:39407_solr ] o.a.s.c.o.SliceMutator New Slice: shard1:{
[junit4] 2> "range":"80000000-7fffffff",
[junit4] 2> "state":"active",
[junit4] 2> "replicas":{"core_node3":{
[junit4] 2> "core":"testNodeAdded_shard1_replica_n1",
[junit4] 2> "base_url":"https://127.0.0.1:39407/solr",
[junit4] 2> "state":"down",
[junit4] 2> "node_name":null,
[junit4] 2> "type":"NRT"}}}
[junit4] 2> 487038 DEBUG
(OverseerStateUpdate-73270130737807363-127.0.0.1:39407_solr-n_0000000000)
[n:127.0.0.1:39407_solr ] o.a.s.c.Overseer processMessage: queueSize: 2,
message = {
[junit4] 2> "operation":"ADDREPLICA",
[junit4] 2> "collection":"testNodeAdded",
[junit4] 2> "shard":"shard1",
[junit4] 2> "core":"testNodeAdded_shard1_replica_n2",
[junit4] 2> "state":"down",
[junit4] 2> "base_url":"https://127.0.0.1:39407/solr",
[junit4] 2> "type":"NRT",
[junit4] 2> "waitForFinalState":"false"} current state version: 0
[junit4] 2> 487038 INFO
(OverseerStateUpdate-73270130737807363-127.0.0.1:39407_solr-n_0000000000)
[n:127.0.0.1:39407_solr ] o.a.s.c.o.SliceMutator createReplica() {
[junit4] 2> "operation":"ADDREPLICA",
[junit4] 2> "collection":"testNodeAdded",
[junit4] 2> "shard":"shard1",
[junit4] 2> "core":"testNodeAdded_shard1_replica_n2",
[junit4] 2> "state":"down",
[junit4] 2> "base_url":"https://127.0.0.1:39407/solr",
[junit4] 2> "type":"NRT",
[junit4] 2> "waitForFinalState":"false"}
[junit4] 2> 487038 DEBUG
(OverseerStateUpdate-73270130737807363-127.0.0.1:39407_solr-n_0000000000)
[n:127.0.0.1:39407_solr ] o.a.s.c.o.SliceMutator Old Slice: shard1:{
[junit4] 2> "range":"80000000-7fffffff",
[junit4] 2> "state":"active",
[junit4] 2> "replicas":{"core_node3":{
[junit4] 2> "core":"testNodeAdded_shard1_replica_n1",
[junit4] 2> "base_url":"https://127.0.0.1:39407/solr",
[junit4] 2> "state":"down",
[junit4] 2> "node_name":null,
[junit4] 2> "type":"NRT"}}}
[junit4] 2> 487038 DEBUG
(OverseerStateUpdate-73270130737807363-127.0.0.1:39407_solr-n_0000000000)
[n:127.0.0.1:39407_solr ] o.a.s.c.o.SliceMutator New Slice: shard1:{
[junit4] 2> "range":"80000000-7fffffff",
[junit4] 2> "state":"active",
[junit4] 2> "replicas":{
[junit4] 2> "core_node3":{
[junit4] 2> "core":"testNodeAdded_shard1_replica_n1",
[junit4] 2> "base_url":"https://127.0.0.1:39407/solr",
[junit4] 2> "state":"down",
[junit4] 2> "node_name":null,
[junit4] 2> "type":"NRT"},
[junit4] 2> "core_node4":{
[junit4] 2> "core":"testNodeAdded_shard1_replica_n2",
[junit4] 2> "base_url":"https://127.0.0.1:39407/solr",
[junit4] 2> "state":"down",
[junit4] 2> "node_name":null,
[junit4] 2> "type":"NRT"}}}
[junit4] 2> 487139 DEBUG
(OverseerStateUpdate-73270130737807363-127.0.0.1:39407_solr-n_0000000000)
[n:127.0.0.1:39407_solr ] o.a.s.c.o.ZkStateWriter going to update_collection
/collections/testNodeAdded/state.json version: 0
[junit4] 2> 487242 INFO (qtp1590159348-3376) [n:127.0.0.1:39407_solr ]
o.a.s.h.a.CoreAdminOperation core create command
qt=/admin/cores&coreNodeName=core_node4&collection.configName=conf&newCollection=true&name=testNodeAdded_shard1_replica_n2&action=CREATE&numShards=1&collection=testNodeAdded&shard=shard1&wt=javabin&version=2&replicaType=NRT
[junit4] 2> 487243 INFO (qtp1590159348-3376) [n:127.0.0.1:39407_solr ]
o.a.s.c.TransientSolrCoreCacheDefault Allocating transient cache for 2147483647
transient cores
[junit4] 2> 487245 INFO (qtp1590159348-3377) [n:127.0.0.1:39407_solr ]
o.a.s.h.a.CoreAdminOperation core create command
qt=/admin/cores&coreNodeName=core_node3&collection.configName=conf&newCollection=true&name=testNodeAdded_shard1_replica_n1&action=CREATE&numShards=1&collection=testNodeAdded&shard=shard1&wt=javabin&version=2&replicaType=NRT
[junit4] 2> 487246 DEBUG
(OverseerStateUpdate-73270130737807363-127.0.0.1:39407_solr-n_0000000000)
[n:127.0.0.1:39407_solr ] o.a.s.c.Overseer processMessage: queueSize: 1,
message = {
[junit4] 2> "core":"testNodeAdded_shard1_replica_n2",
[junit4] 2> "core_node_name":"core_node4",
[junit4] 2> "roles":null,
[junit4] 2> "base_url":"https://127.0.0.1:39407/solr",
[junit4] 2> "node_name":"127.0.0.1:39407_solr",
[junit4] 2> "numShards":"1",
[junit4] 2> "state":"down",
[junit4] 2> "shard":"shard1",
[junit4] 2> "collection":"testNodeAdded",
[junit4] 2> "type":"NRT",
[junit4] 2> "operation":"state"} current state version: 0
[junit4] 2> 487246 DEBUG
(OverseerStateUpdate-73270130737807363-127.0.0.1:39407_solr-n_0000000000)
[n:127.0.0.1:39407_solr ] o.a.s.c.o.ReplicaMutator Update state numShards=1
message={
[junit4] 2> "core":"testNodeAdded_shard1_replica_n2",
[junit4] 2> "core_node_name":"core_node4",
[junit4] 2> "roles":null,
[junit4] 2> "base_url":"https://127.0.0.1:39407/solr",
[junit4] 2> "node_name":"127.0.0.1:39407_solr",
[junit4] 2> "numShards":"1",
[junit4] 2> "state":"down",
[junit4] 2> "shard":"shard1",
[junit4] 2> "collection":"testNodeAdded",
[junit4] 2> "type":"NRT",
[junit4] 2> "operation":"state"}
[junit4] 2> 487246 DEBUG
(OverseerStateUpdate-73270130737807363-127.0.0.1:39407_solr-n_0000000000)
[n:127.0.0.1:39407_solr ] o.a.s.c.o.ReplicaMutator Will update state for
replica:
core_node4:{"core":"testNodeAdded_shard1_replica_n2","base_url":"https://127.0.0.1:39407/solr","node_name":"127.0.0.1:39407_solr","state":"down","type":"NRT"}
[junit4] 2> 487246 DEBUG
(OverseerStateUpdate-73270130737807363-127.0.0.1:39407_solr-n_0000000000)
[n:127.0.0.1:39407_solr ] o.a.s.c.o.ReplicaMutator Collection is now:
DocCollection(testNodeAdded//collections/testNodeAdded/state.json/1)={
[junit4] 2> "pullReplicas":"0",
[junit4] 2> "replicationFactor":"2",
[junit4] 2> "router":{"name":"compositeId"},
[junit4] 2> "maxShardsPerNode":"1",
[junit4] 2> "autoAddReplicas":"false",
[junit4] 2> "nrtReplicas":"2",
[junit4] 2> "tlogReplicas":"0",
[junit4] 2> "shards":{"shard1":{
[junit4] 2> "range":"80000000-7fffffff",
[junit4] 2> "state":"active",
[junit4] 2> "replicas":{
[junit4] 2> "core_node3":{
[junit4] 2> "core":"testNodeAdded_shard1_replica_n1",
[junit4] 2> "base_url":"https://127.0.0.1:39407/solr",
[junit4] 2> "state":"down",
[junit4] 2> "node_name":null,
[junit4] 2> "type":"NRT"},
[junit4] 2> "core_node4":{
[junit4] 2> "core":"testNodeAdded_shard1_replica_n2",
[junit4] 2> "base_url":"https://127.0.0.1:39407/solr",
[junit4] 2> "node_name":"127.0.0.1:39407_solr",
[junit4] 2> "state":"down",
[junit4] 2> "type":"NRT"}}}}}
[junit4] 2> 487247 DEBUG
(OverseerStateUpdate-73270130737807363-127.0.0.1:39407_solr-n_0000000000)
[n:127.0.0.1:39407_solr ] o.a.s.c.Overseer processMessage: queueSize: 2,
message = {
[junit4] 2> "core":"testNodeAdded_shard1_replica_n1",
[junit4] 2> "core_node_name":"core_node3",
[junit4] 2> "roles":null,
[junit4] 2> "base_url":"https://127.0.0.1:39407/solr",
[junit4] 2> "node_name":"127.0.0.1:39407_solr",
[junit4] 2> "numShards":"1",
[junit4] 2> "state":"down",
[junit4] 2> "shard":"shard1",
[junit4] 2> "collection":"testNodeAdded",
[junit4] 2> "type":"NRT",
[junit4] 2> "operation":"state"} current state version: 0
[junit4] 2> 487247 DEBUG
(OverseerStateUpdate-73270130737807363-127.0.0.1:39407_solr-n_0000000000)
[n:127.0.0.1:39407_solr ] o.a.s.c.o.ReplicaMutator Update state numShards=1
message={
[junit4] 2> "core":"testNodeAdded_shard1_replica_n1",
[junit4] 2> "core_node_name":"core_node3",
[junit4] 2> "roles":null,
[junit4] 2> "base_url":"https://127.0.0.1:39407/solr",
[junit4] 2> "node_name":"127.0.0.1:39407_solr",
[junit4] 2> "numShards":"1",
[junit4] 2> "state":"down",
[junit4] 2> "shard":"shard1",
[junit4] 2> "collection":"testNodeAdded",
[junit4] 2> "type":"NRT",
[junit4] 2> "operation":"state"}
[junit4] 2> 487247 DEBUG
(OverseerStateUpdate-73270130737807363-127.0.0.1:39407_solr-n_0000000000)
[n:127.0.0.1:39407_solr ] o.a.s.c.o.ReplicaMutator Will update state for
replica:
core_node3:{"core":"testNodeAdded_shard1_replica_n1","base_url":"https://127.0.0.1:39407/solr","node_name":"127.0.0.1:39407_solr","state":"down","type":"NRT"}
[junit4] 2> 487247 DEBUG
(OverseerStateUpdate-73270130737807363-127.0.0.1:39407_solr-n_0000000000)
[n:127.0.0.1:39407_solr ] o.a.s.c.o.ReplicaMutator Collection is now:
DocCollection(testNodeAdded//collections/testNodeAdded/state.json/1)={
[junit4] 2> "pullReplicas":"0",
[junit4] 2> "replicationFactor":"2",
[junit4] 2> "router":{"name":"compositeId"},
[junit4] 2> "maxShardsPerNode":"1",
[junit4] 2> "autoAddReplicas":"false",
[junit4] 2> "nrtReplicas":"2",
[junit4] 2> "tlogReplicas":"0",
[junit4] 2> "shards":{"shard1":{
[junit4] 2> "range":"80000000-7fffffff",
[junit4] 2> "state":"active",
[junit4] 2> "replicas":{
[junit4] 2> "core_node3":{
[junit4] 2> "core":"testNodeAdded_shard1_replica_n1",
[junit4] 2> "base_url":"https://127.0.0.1:39407/solr",
[junit4] 2> "node_name":"127.0.0.1:39407_solr",
[junit4] 2> "state":"down",
[junit4] 2> "type":"NRT"},
[junit4] 2> "core_node4":{
[junit4] 2> "core":"testNodeAdded_shard1_replica_n2",
[junit4] 2> "base_url":"https://127.0.0.1:39407/solr",
[junit4] 2> "node_name":"127.0.0.1:39407_solr",
[junit4] 2> "state":"down",
[junit4] 2> "type":"NRT"}}}}}
[junit4] 2> 487348 DEBUG
(OverseerStateUpdate-73270130737807363-127.0.0.1:39407_solr-n_0000000000)
[n:127.0.0.1:39407_solr ] o.a.s.c.o.ZkStateWriter going to update_collection
/collections/testNodeAdded/state.json version: 1
[junit4] 2> 487348 INFO
(zkCallback-905-thread-1-processing-n:127.0.0.1:39407_solr)
[n:127.0.0.1:39407_solr ] o.a.s.c.c.ZkStateReader A cluster state change:
[WatchedEvent state:SyncConnected type:NodeDataChanged
path:/collections/testNodeAdded/state.json] for collection [testNodeAdded] has
occurred - updating... (live nodes size: [1])
[junit4] 2> 487348 INFO
(zkCallback-905-thread-2-processing-n:127.0.0.1:39407_solr)
[n:127.0.0.1:39407_solr ] o.a.s.c.c.ZkStateReader A cluster state change:
[WatchedEvent state:SyncConnected type:NodeDataChanged
path:/collections/testNodeAdded/state.json] for collection [testNodeAdded] has
occurred - updating... (live nodes size: [1])
[junit4] 2> 487914 DEBUG (ScheduledTrigger-1140-thread-2)
[n:127.0.0.1:39407_solr ] o.a.s.c.a.NodeAddedTrigger Running
NodeAddedTrigger node_added_trigger
[junit4] 2> 487914 DEBUG (ScheduledTrigger-1140-thread-2)
[n:127.0.0.1:39407_solr ] o.a.s.c.a.NodeAddedTrigger Found livenodes: 1
[junit4] 2> 488256 INFO (qtp1590159348-3377) [n:127.0.0.1:39407_solr
c:testNodeAdded s:shard1 r:core_node3 x:testNodeAdded_shard1_replica_n1]
o.a.s.c.SolrConfig Using Lucene MatchVersion: 8.0.0
[junit4] 2> 488259 INFO (qtp1590159348-3376) [n:127.0.0.1:39407_solr
c:testNodeAdded s:shard1 r:core_node4 x:testNodeAdded_shard1_replica_n2]
o.a.s.c.SolrConfig Using Lucene MatchVersion: 8.0.0
[junit4] 2> 488262 INFO (qtp1590159348-3377) [n:127.0.0.1:39407_solr
c:testNodeAdded s:shard1 r:core_node3 x:testNodeAdded_shard1_replica_n1]
o.a.s.s.IndexSchema [testNodeAdded_shard1_replica_n1] Schema name=minimal
[junit4] 2> 488265 INFO (qtp1590159348-3377) [n:127.0.0.1:39407_solr
c:testNodeAdded s:shard1 r:core_node3 x:testNodeAdded_shard1_replica_n1]
o.a.s.s.IndexSchema Loaded schema minimal/1.1 with uniqueid field id
[junit4] 2> 488265 INFO (qtp1590159348-3377) [n:127.0.0.1:39407_solr
c:testNodeAdded s:shard1 r:core_node3 x:testNodeAdded_shard1_replica_n1]
o.a.s.c.CoreContainer Creating SolrCore 'testNodeAdded_shard1_replica_n1' using
configuration from collection testNodeAdded, trusted=true
[junit4] 2> 488270 INFO (qtp1590159348-3377) [n:127.0.0.1:39407_solr
c:testNodeAdded s:shard1 r:core_node3 x:testNodeAdded_shard1_replica_n1]
o.a.s.m.r.SolrJmxReporter JMX monitoring for
'solr_39407.solr.core.testNodeAdded.shard1.replica_n1' (registry
'solr.core.testNodeAdded.shard1.replica_n1') enabled at server:
com.sun.jmx.mbeanserver.JmxMBeanServer@7bb3a730
[junit4] 2> 488270 INFO (qtp1590159348-3377) [n:127.0.0.1:39407_solr
c:testNodeAdded s:shard1 r:core_node3 x:testNodeAdded_shard1_replica_n1]
o.a.s.c.SolrCore solr.RecoveryStrategy.Builder
[junit4] 2> 488270 INFO (qtp1590159348-3377) [n:127.0.0.1:39407_solr
c:testNodeAdded s:shard1 r:core_node3 x:testNodeAdded_shard1_replica_n1]
o.a.s.c.SolrCore [[testNodeAdded_shard1_replica_n1] ] Opening new SolrCore at
[/x1/jenkins/jenkins-slave/workspace/Lucene-Solr-Tests-master/solr/build/solr-core/test/J1/temp/solr.cloud.autoscaling.ComputePlanActionTest_43B9CF7079FA8FBB-001/tempDir-001/node1/testNodeAdded_shard1_replica_n1],
dataDir=[/x1/jenkins/jenkins-slave/workspace/Lucene-Solr-Tests-master/solr/build/solr-core/test/J1/temp/solr.cloud.autoscaling.ComputePlanActionTest_43B9CF7079FA8FBB-001/tempDir-001/node1/./testNodeAdded_shard1_replica_n1/data/]
[junit4] 2> 488271 INFO (qtp1590159348-3376) [n:127.0.0.1:39407_solr
c:testNodeAdded s:shard1 r:core_node4 x:testNodeAdded_shard1_replica_n2]
o.a.s.s.IndexSchema [testNodeAdded_shard1_replica_n2] Schema name=minimal
[junit4] 2> 488273 INFO (qtp1590159348-3376) [n:127.0.0.1:39407_solr
c:testNodeAdded s:shard1 r:core_node4 x:testNodeAdded_shard1_replica_n2]
o.a.s.s.IndexSchema Loaded schema minimal/1.1 with uniqueid field id
[junit4] 2> 488273 INFO (qtp1590159348-3376) [n:127.0.0.1:39407_solr
c:testNodeAdded s:shard1 r:core_node4 x:testNodeAdded_shard1_replica_n2]
o.a.s.c.CoreContainer Creating SolrCore 'testNodeAdded_shard1_replica_n2' using
configuration from collection testNodeAdded, trusted=true
[junit4] 2> 488273 INFO (qtp1590159348-3376) [n:127.0.0.1:39407_solr
c:testNodeAdded s:shard1 r:core_node4 x:testNodeAdded_shard1_replica_n2]
o.a.s.m.r.SolrJmxReporter JMX monitoring for
'solr_39407.solr.core.testNodeAdded.shard1.replica_n2' (registry
'solr.core.testNodeAdded.shard1.replica_n2') enabled at server:
com.sun.jmx.mbeanserver.JmxMBeanServer@7bb3a730
[junit4] 2> 488273 INFO (qtp1590159348-3376) [n:127.0.0.1:39407_solr
c:testNodeAdded s:shard1 r:core_node4 x:testNodeAdded_shard1_replica_n2]
o.a.s.c.SolrCore solr.RecoveryStrategy.Builder
[junit4] 2> 488273 INFO (qtp1590159348-3376) [n:127.0.0.1:39407_solr
c:testNodeAdded s:shard1 r:core_node4 x:testNodeAdded_shard1_replica_n2]
o.a.s.c.SolrCore [[testNodeAdded_shard1_replica_n2] ] Opening new SolrCore at
[/x1/jenkins/jenkins-slave/workspace/Lucene-Solr-Tests-master/solr/build/solr-core/test/J1/temp/solr.cloud.autoscaling.ComputePlanActionTest_43B9CF7079FA8FBB-001/tempDir-001/node1/testNodeAdded_shard1_replica_n2],
dataDir=[/x1/jenkins/jenkins-slave/workspace/Lucene-Solr-Tests-master/solr/build/solr-core/test/J1/temp/solr.cloud.autoscaling.ComputePlanActionTest_43B9CF7079FA8FBB-001/tempDir-001/node1/./testNodeAdded_shard1_replica_n2/data/]
[junit4] 2> 488318 INFO (qtp1590159348-3376) [n:127.0.0.1:39407_solr
c:testNodeAdded s:shard1 r:core_node4 x:testNodeAdded_shard1_replica_n2]
o.a.s.u.UpdateHandler Using UpdateLog implementation:
org.apache.solr.update.UpdateLog
[junit4] 2> 488319 INFO (qtp1590159348-3376) [n:127.0.0.1:39407_solr
c:testNodeAdded s:shard1 r:core_node4 x:testNodeAdded_shard1_replica_n2]
o.a.s.u.UpdateLog Initializing UpdateLog: dataDir=null defaultSyncLevel=FLUSH
numRecordsToKeep=100 maxNumLogsToKeep=10 numVersionBuckets=65536
[junit4] 2> 488320 INFO (qtp1590159348-3376) [n:127.0.0.1:39407_solr
c:testNodeAdded s:shard1 r:core_node4 x:testNodeAdded_shard1_replica_n2]
o.a.s.u.CommitTracker Hard AutoCommit: disabled
[junit4] 2> 488320 INFO (qtp1590159348-3376) [n:127.0.0.1:39407_solr
c:testNodeAdded s:shard1 r:core_node4 x:testNodeAdded_shard1_replica_n2]
o.a.s.u.CommitTracker Soft AutoCommit: disabled
[junit4] 2> 488320 INFO (qtp1590159348-3377) [n:127.0.0.1:39407_solr
c:testNodeAdded s:shard1 r:core_node3 x:testNodeAdded_shard1_replica_n1]
o.a.s.u.UpdateHandler Using UpdateLog implementation:
org.apache.solr.update.UpdateLog
[junit4] 2> 488320 INFO (qtp1590159348-3377) [n:127.0.0.1:39407_solr
c:testNodeAdded s:shard1 r:core_node3 x:testNodeAdded_shard1_replica_n1]
o.a.s.u.UpdateLog Initializing UpdateLog: dataDir=null defaultSyncLevel=FLUSH
numRecordsToKeep=100 maxNumLogsToKeep=10 numVersionBuckets=65536
[junit4] 2> 488321 INFO (qtp1590159348-3376) [n:127.0.0.1:39407_solr
c:testNodeAdded s:shard1 r:core_node4 x:testNodeAdded_shard1_replica_n2]
o.a.s.s.SolrIndexSearcher Opening
[Searcher@7e4cdba3[testNodeAdded_shard1_replica_n2] main]
[junit4] 2> 488321 INFO (qtp1590159348-3377) [n:127.0.0.1:39407_solr
c:testNodeAdded s:shard1 r:core_node3 x:testNodeAdded_shard1_replica_n1]
o.a.s.u.CommitTracker Hard AutoCommit: disabled
[junit4] 2> 488321 INFO (qtp1590159348-3377) [n:127.0.0.1:39407_solr
c:testNodeAdded s:shard1 r:core_node3 x:testNodeAdded_shard1_replica_n1]
o.a.s.u.CommitTracker Soft AutoCommit: disabled
[junit4] 2> 488322 INFO (qtp1590159348-3377) [n:127.0.0.1:39407_solr
c:testNodeAdded s:shard1 r:core_node3 x:testNodeAdded_shard1_replica_n1]
o.a.s.s.SolrIndexSearcher Opening
[Searcher@745a6ad3[testNodeAdded_shard1_replica_n1] main]
[junit4] 2> 488323 INFO (qtp1590159348-3376) [n:127.0.0.1:39407_solr
c:testNodeAdded s:shard1 r:core_node4 x:testNodeAdded_shard1_replica_n2]
o.a.s.r.ManagedResourceStorage Configured ZooKeeperStorageIO with znodeBase:
/configs/conf
[junit4] 2> 488323 INFO (qtp1590159348-3376) [n:127.0.0.1:39407_solr
c:testNodeAdded s:shard1 r:core_node4 x:testNodeAdded_shard1_replica_n2]
o.a.s.r.ManagedResourceStorage Loaded null at path _rest_managed.json using
ZooKeeperStorageIO:path=/configs/conf
[junit4] 2> 488324 INFO (qtp1590159348-3376) [n:127.0.0.1:39407_solr
c:testNodeAdded s:shard1 r:core_node4 x:testNodeAdded_shard1_replica_n2]
o.a.s.h.ReplicationHandler Commits will be reserved for 10000ms.
[junit4] 2> 488325 INFO
(searcherExecutor-1146-thread-1-processing-n:127.0.0.1:39407_solr
x:testNodeAdded_shard1_replica_n2 s:shard1 c:testNodeAdded r:core_node4)
[n:127.0.0.1:39407_solr c:testNodeAdded s:shard1 r:core_node4
x:testNodeAdded_shard1_replica_n2] o.a.s.c.SolrCore
[testNodeAdded_shard1_replica_n2] Registered new searcher
Searcher@7e4cdba3[testNodeAdded_shard1_replica_n2]
main{ExitableDirectoryReader(UninvertingDirectoryReader())}
[junit4] 2> 488325 INFO (qtp1590159348-3376) [n:127.0.0.1:39407_solr
c:testNodeAdded s:shard1 r:core_node4 x:testNodeAdded_shard1_replica_n2]
o.a.s.u.UpdateLog Could not find max version in index or recent updates, using
new clock 1592000441695076352
[junit4] 2> 488330 INFO (qtp1590159348-3377) [n:127.0.0.1:39407_solr
c:testNodeAdded s:shard1 r:core_node3 x:testNodeAdded_shard1_replica_n1]
o.a.s.r.ManagedResourceStorage Configured ZooKeeperStorageIO with znodeBase:
/configs/conf
[junit4] 2> 488330 INFO (qtp1590159348-3377) [n:127.0.0.1:39407_solr
c:testNodeAdded s:shard1 r:core_node3 x:testNodeAdded_shard1_replica_n1]
o.a.s.r.ManagedResourceStorage Loaded null at path _rest_managed.json using
ZooKeeperStorageIO:path=/configs/conf
[junit4] 2> 488331 INFO (qtp1590159348-3377) [n:127.0.0.1:39407_solr
c:testNodeAdded s:shard1 r:core_node3 x:testNodeAdded_shard1_replica_n1]
o.a.s.h.ReplicationHandler Commits will be reserved for 10000ms.
[junit4] 2> 488331 INFO (qtp1590159348-3377) [n:127.0.0.1:39407_solr
c:testNodeAdded s:shard1 r:core_node3 x:testNodeAdded_shard1_replica_n1]
o.a.s.u.UpdateLog Could not find max version in index or recent updates, using
new clock 1592000441701367808
[junit4] 2> 488332 INFO
(searcherExecutor-1145-thread-1-processing-n:127.0.0.1:39407_solr
x:testNodeAdded_shard1_replica_n1 s:shard1 c:testNodeAdded r:core_node3)
[n:127.0.0.1:39407_solr c:testNodeAdded s:shard1 r:core_node3
x:testNodeAdded_shard1_replica_n1] o.a.s.c.SolrCore
[testNodeAdded_shard1_replica_n1] Registered new searcher
Searcher@745a6ad3[testNodeAdded_shard1_replica_n1]
main{ExitableDirectoryReader(UninvertingDirectoryReader())}
[junit4] 2> 488341 INFO (qtp1590159348-3377) [n:127.0.0.1:39407_solr
c:testNodeAdded s:shard1 r:core_node3 x:testNodeAdded_shard1_replica_n1]
o.a.s.c.ZkShardTerms Failed to save terms, version is not match, retrying
[junit4] 2> 488351 INFO (qtp1590159348-3377) [n:127.0.0.1:39407_solr
c:testNodeAdded s:shard1 r:core_node3 x:testNodeAdded_shard1_replica_n1]
o.a.s.c.ShardLeaderElectionContext Waiting until we see more replicas up for
shard shard1: total=2 found=1 timeoutin=9999ms
[junit4] 2> 488351 DEBUG
(OverseerStateUpdate-73270130737807363-127.0.0.1:39407_solr-n_0000000000)
[n:127.0.0.1:39407_solr ] o.a.s.c.Overseer processMessage: queueSize: 1,
message = {
[junit4] 2> "operation":"leader",
[junit4] 2> "shard":"shard1",
[junit4] 2> "collection":"testNodeAdded"} current state version: 0
[junit4] 2> 488451 DEBUG
(OverseerStateUpdate-73270130737807363-127.0.0.1:39407_solr-n_0000000000)
[n:127.0.0.1:39407_solr ] o.a.s.c.o.ZkStateWriter going to update_collection
/collections/testNodeAdded/state.json version: 2
[junit4] 2> 488452 INFO
(zkCallback-905-thread-2-processing-n:127.0.0.1:39407_solr)
[n:127.0.0.1:39407_solr ] o.a.s.c.c.ZkStateReader A cluster state change:
[WatchedEvent state:SyncConnected type:NodeDataChanged
path:/collections/testNodeAdded/state.json] for collection [testNodeAdded] has
occurred - updating... (live nodes size: [1])
[junit4] 2> 488452 INFO
(zkCallback-905-thread-1-processing-n:127.0.0.1:39407_solr)
[n:127.0.0.1:39407_solr ] o.a.s.c.c.ZkStateReader A cluster state change:
[WatchedEvent state:SyncConnected type:NodeDataChanged
path:/collections/testNodeAdded/state.json] for collection [testNodeAdded] has
occurred - updating... (live nodes size: [1])
[junit4] 2> 488851 INFO (qtp1590159348-3377) [n:127.0.0.1:39407_solr
c:testNodeAdded s:shard1 r:core_node3 x:testNodeAdded_shard1_replica_n1]
o.a.s.c.ShardLeaderElectionContext Enough replicas found to continue.
[junit4] 2> 488852 INFO (qtp1590159348-3377) [n:127.0.0.1:39407_solr
c:testNodeAdded s:shard1 r:core_node3 x:testNodeAdded_shard1_replica_n1]
o.a.s.c.ShardLeaderElectionContext I may be the new leader - try and sync
[junit4] 2> 488852 INFO (qtp1590159348-3377) [n:127.0.0.1:39407_solr
c:testNodeAdded s:shard1 r:core_node3 x:testNodeAdded_shard1_replica_n1]
o.a.s.c.SyncStrategy Sync replicas to
https://127.0.0.1:39407/solr/testNodeAdded_shard1_replica_n1/
[junit4] 2> 488852 INFO (qtp1590159348-3377) [n:127.0.0.1:39407_solr
c:testNodeAdded s:shard1 r:core_node3 x:testNodeAdded_shard1_replica_n1]
o.a.s.u.PeerSync PeerSync: core=testNodeAdded_shard1_replica_n1
url=https://127.0.0.1:39407/solr START
replicas=[https://127.0.0.1:39407/solr/testNodeAdded_shard1_replica_n2/]
nUpdates=100
[junit4] 2> 488856 INFO (qtp1590159348-3375) [n:127.0.0.1:39407_solr
c:testNodeAdded s:shard1 r:core_node4 x:testNodeAdded_shard1_replica_n2]
o.a.s.c.S.Request [testNodeAdded_shard1_replica_n2] webapp=/solr path=/get
params={distrib=false&qt=/get&fingerprint=false&getVersions=100&wt=javabin&version=2}
status=0 QTime=0
[junit4] 2> 488914 DEBUG (ScheduledTrigger-1140-thread-2)
[n:127.0.0.1:39407_solr ] o.a.s.c.a.NodeAddedTrigger Running
NodeAddedTrigger node_added_trigger
[junit4] 2> 488914 DEBUG (ScheduledTrigger-1140-thread-2)
[n:127.0.0.1:39407_solr ] o.a.s.c.a.NodeAddedTrigger Found livenodes: 1
[junit4] 2> 489152 INFO (qtp1590159348-3377) [n:127.0.0.1:39407_solr
c:testNodeAdded s:shard1 r:core_node3 x:testNodeAdded_shard1_replica_n1]
o.a.s.u.PeerSync PeerSync: core=testNodeAdded_shard1_replica_n1
url=https://127.0.0.1:39407/solr DONE. We have no versions. sync failed.
[junit4] 2> 489153 INFO (qtp1590159348-3377) [n:127.0.0.1:39407_solr
c:testNodeAdded s:shard1 r:core_node3 x:testNodeAdded_shard1_replica_n1]
o.a.s.c.SyncStrategy Leader's attempt to sync with shard failed, moving to the
next candidate
[junit4] 2> 489153 INFO (qtp1590159348-3377) [n:127.0.0.1:39407_solr
c:testNodeAdded s:shard1 r:core_node3 x:testNodeAdded_shard1_replica_n1]
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> 489153 INFO (qtp1590159348-3377) [n:127.0.0.1:39407_solr
c:testNodeAdded s:shard1 r:core_node3 x:testNodeAdded_shard1_replica_n1]
o.a.s.c.ShardLeaderElectionContext Found all replicas participating in
election, clear LIR
[junit4] 2> 489156 INFO (qtp1590159348-3377) [n:127.0.0.1:39407_solr
c:testNodeAdded s:shard1 r:core_node3 x:testNodeAdded_shard1_replica_n1]
o.a.s.c.ShardLeaderElectionContext I am the new leader:
https://127.0.0.1:39407/solr/testNodeAdded_shard1_replica_n1/ shard1
[junit4] 2> 489156 DEBUG
(OverseerStateUpdate-73270130737807363-127.0.0.1:39407_solr-n_0000000000)
[n:127.0.0.1:39407_solr ] o.a.s.c.Overseer processMessage: queueSize: 1,
message = {
[junit4] 2> "operation":"leader",
[junit4] 2> "shard":"shard1",
[junit4] 2> "collection":"testNodeAdded",
[junit4] 2> "base_url":"https://127.0.0.1:39407/solr",
[junit4] 2> "core":"testNodeAdded_shard1_replica_n1",
[junit4] 2> "state":"active"} current state version: 0
[junit4] 2> 489257 DEBUG
(OverseerStateUpdate-73270130737807363-127.0.0.1:39407_solr-n_0000000000)
[n:127.0.0.1:39407_solr ] o.a.s.c.o.ZkStateWriter going to update_collection
/collections/testNodeAdded/state.json version: 3
[junit4] 2> 489257 INFO
(zkCallback-905-thread-3-processing-n:127.0.0.1:39407_solr)
[n:127.0.0.1:39407_solr ] o.a.s.c.c.ZkStateReader A cluster state change:
[WatchedEvent state:SyncConnected type:NodeDataChanged
path:/collections/testNodeAdded/state.json] for collection [testNodeAdded] has
occurred - updating... (live nodes size: [1])
[junit4] 2> 489257 INFO
(zkCallback-905-thread-1-processing-n:127.0.0.1:39407_solr)
[n:127.0.0.1:39407_solr ] o.a.s.c.c.ZkStateReader A cluster state change:
[WatchedEvent state:SyncConnected type:NodeDataChanged
path:/collections/testNodeAdded/state.json] for collection [testNodeAdded] has
occurred - updating... (live nodes size: [1])
[junit4] 2> 489306 INFO (qtp1590159348-3377) [n:127.0.0.1:39407_solr
c:testNodeAdded s:shard1 r:core_node3 x:testNodeAdded_shard1_replica_n1]
o.a.s.c.ZkController I am the leader, no recovery necessary
[junit4] 2> 489308 DEBUG
(OverseerStateUpdate-73270130737807363-127.0.0.1:39407_solr-n_0000000000)
[n:127.0.0.1:39407_solr ] o.a.s.c.Overseer processMessage: queueSize: 1,
message = {
[junit4] 2> "core":"testNodeAdded_shard1_replica_n1",
[junit4] 2> "core_node_name":"core_node3",
[junit4] 2> "roles":null,
[junit4] 2> "base_url":"https://127.0.0.1:39407/solr",
[junit4] 2> "node_name":"127.0.0.1:39407_solr",
[junit4] 2> "numShards":"1",
[junit4] 2> "state":"active",
[junit4] 2> "shard":"shard1",
[junit4] 2> "collection":"testNodeAdded",
[junit4] 2> "type":"NRT",
[junit4] 2> "operation":"state"} current state version: 0
[junit4] 2> 489308 DEBUG
(OverseerStateUpdate-73270130737807363-127.0.0.1:39407_solr-n_0000000000)
[n:127.0.0.1:39407_solr ] o.a.s.c.o.ReplicaMutator Update state numShards=1
message={
[junit4] 2> "core":"testNodeAdded_shard1_replica_n1",
[junit4] 2> "core_node_name":"core_node3",
[junit4] 2> "roles":null,
[junit4] 2> "base_url":"https://127.0.0.1:39407/solr",
[junit4] 2> "node_name":"127.0.0.1:39407_solr",
[junit4] 2> "numShards":"1",
[junit4] 2> "state":"active",
[junit4] 2> "shard":"shard1",
[junit4] 2> "collection":"testNodeAdded",
[junit4] 2> "type":"NRT",
[junit4] 2> "operation":"state"}
[junit4] 2> 489308 DEBUG
(OverseerStateUpdate-73270130737807363-127.0.0.1:39407_solr-n_0000000000)
[n:127.0.0.1:39407_solr ] o.a.s.c.o.ReplicaMutator Will update state for
replica:
core_node3:{"core":"testNodeAdded_shard1_replica_n1","base_url":"https://127.0.0.1:39407/solr","node_name":"127.0.0.1:39407_solr","state":"active","type":"NRT","leader":"true"}
[junit4] 2> 489308 DEBUG
(OverseerStateUpdate-73270130737807363-127.0.0.1:39407_solr-n_0000000000)
[n:127.0.0.1:39407_solr ] o.a.s.c.o.ReplicaMutator Collection is now:
DocCollection(testNodeAdded//collections/testNodeAdded/state.json/4)={
[junit4] 2> "pullReplicas":"0",
[junit4] 2> "replicationFactor":"2",
[junit4] 2> "router":{"name":"compositeId"},
[junit4] 2> "maxShardsPerNode":"1",
[junit4] 2> "autoAddReplicas":"false",
[junit4] 2> "nrtReplicas":"2",
[junit4] 2> "tlogReplicas":"0",
[junit4] 2> "shards":{"shard1":{
[junit4] 2> "range":"80000000-7fffffff",
[junit4] 2> "state":"active",
[junit4] 2> "replicas":{
[junit4] 2> "core_node3":{
[junit4] 2> "core":"testNodeAdded_shard1_replica_n1",
[junit4] 2> "base_url":"https://127.0.0.1:39407/solr",
[junit4] 2> "node_name":"127.0.0.1:39407_solr",
[junit4] 2> "state":"active",
[junit4] 2> "type":"NRT",
[junit4] 2> "leader":"true"},
[junit4] 2> "core_node4":{
[junit4] 2> "core":"testNodeAdded_shard1_replica_n2",
[junit4] 2> "base_url":"https://127.0.0.1:39407/solr",
[junit4] 2> "node_name":"127.0.0.1:39407_solr",
[junit4] 2> "state":"down",
[junit4] 2> "type":"NRT"}}}}}
[junit4] 2> 489308 INFO (qtp1590159348-3377) [n:127.0.0.1:39407_solr
c:testNodeAdded s:shard1 r:core_node3 x:testNodeAdded_shard1_replica_n1]
o.a.s.s.HttpSolrCall [admin] webapp=null path=/admin/cores
params={qt=/admin/cores&coreNodeName=core_node3&collection.configName=conf&newCollection=true&name=testNodeAdded_shard1_replica_n1&action=CREATE&numShards=1&collection=testNodeAdded&shard=shard1&wt=javabin&version=2&replicaType=NRT}
status=0 QTime=2063
[junit4] 2> 489359 DEBUG
(OverseerStateUpdate-73270130737807363-127.0.0.1:39407_solr-n_0000000000)
[n:127.0.0.1:39407_solr ] o.a.s.c.Overseer processMessage: queueSize: 2,
message = {
[junit4] 2> "core":"testNodeAdded_shard1_replica_n2",
[junit4] 2> "core_node_name":"core_node4",
[junit4] 2> "roles":null,
[junit4] 2> "base_url":"https://127.0.0.1:39407/solr",
[junit4] 2> "node_name":"127.0.0.1:39407_solr",
[junit4] 2> "numShards":"1",
[junit4] 2> "state":"active",
[junit4] 2> "shard":"shard1",
[junit4] 2> "collection":"testNodeAdded",
[junit4] 2> "type":"NRT",
[junit4] 2> "operation":"state"} current state version: 0
[junit4] 2> 489360 DEBUG
(OverseerStateUpdate-73270130737807363-127.0.0.1:39407_solr-n_0000000000)
[n:127.0.0.1:39407_solr ] o.a.s.c.o.ReplicaMutator Update state numShards=1
message={
[junit4] 2> "core":"testNodeAdded_shard1_replica_n2",
[junit4] 2> "core_node_name":"core_node4",
[junit4] 2> "roles":null,
[junit4] 2> "base_url":"https://127.0.0.1:39407/solr",
[junit4] 2> "node_name":"127.0.0.1:39407_solr",
[junit4] 2> "numShards":"1",
[junit4] 2> "state":"active",
[junit4] 2> "shard":"shard1",
[junit4] 2> "collection":"testNodeAdded",
[junit4] 2> "type":"NRT",
[junit4] 2> "operation":"state"}
[junit4] 2> 489360 DEBUG
(OverseerStateUpdate-73270130737807363-127.0.0.1:39407_solr-n_0000000000)
[n:127.0.0.1:39407_solr ] o.a.s.c.o.ReplicaMutator Will update state for
replica:
core_node4:{"core":"testNodeAdded_shard1_replica_n2","base_url":"https://127.0.0.1:39407/solr","node_name":"127.0.0.1:39407_solr","state":"active","type":"NRT"}
[junit4] 2> 489360 DEBUG
(OverseerStateUpdate-73270130737807363-127.0.0.1:39407_solr-n_0000000000)
[n:127.0.0.1:39407_solr ] o.a.s.c.o.ReplicaMutator Collection is now:
DocCollection(testNodeAdded//collections/testNodeAdded/state.json/4)={
[junit4] 2> "pullReplicas":"0",
[junit4] 2> "replicationFactor":"2",
[junit4] 2> "router":{"name":"compositeId"},
[junit4] 2> "maxShardsPerNode":"1",
[junit4] 2> "autoAddReplicas":"false",
[junit4] 2> "nrtReplicas":"2",
[junit4] 2> "tlogReplicas":"0",
[junit4] 2> "shards":{"shard1":{
[junit4] 2> "range":"80000000-7fffffff",
[junit4] 2> "state":"active",
[junit4] 2> "replicas":{
[junit4] 2> "core_node3":{
[junit4] 2> "core":"testNodeAdded_shard1_replica_n1",
[junit4] 2> "base_url":"https://127.0.0.1:39407/solr",
[junit4] 2> "node_name":"127.0.0.1:39407_solr",
[junit4] 2> "state":"active",
[junit4] 2> "type":"NRT",
[junit4] 2> "leader":"true"},
[junit4] 2> "core_node4":{
[junit4] 2> "core":"testNodeAdded_shard1_replica_n2",
[junit4] 2> "base_url":"https://127.0.0.1:39407/solr",
[junit4] 2> "node_name":"127.0.0.1:39407_solr",
[junit4] 2> "state":"active",
[junit4] 2> "type":"NRT"}}}}}
[junit4] 2> 489360 INFO (qtp1590159348-3376) [n:127.0.0.1:39407_solr
c:testNodeAdded s:shard1 r:core_node4 x:testNodeAdded_shard1_replica_n2]
o.a.s.s.HttpSolrCall [admin] webapp=null path=/admin/cores
params={qt=/admin/cores&coreNodeName=core_node4&collection.configName=conf&newCollection=true&name=testNodeAdded_shard1_replica_n2&action=CREATE&numShards=1&collection=testNodeAdded&shard=shard1&wt=javabin&version=2&replicaType=NRT}
status=0 QTime=2117
[junit4] 2> 489364 INFO (qtp1590159348-3374) [n:127.0.0.1:39407_solr ]
o.a.s.h.a.CollectionsHandler Wait for new collection to be active for at most
30 seconds. Check all shard replicas
[junit4] 2> 489460 DEBUG
(OverseerStateUpdate-73270130737807363-127.0.0.1:39407_solr-n_0000000000)
[n:127.0.0.1:39407_solr ] o.a.s.c.o.ZkStateWriter going to update_collection
/collections/testNodeAdded/state.json version: 4
[junit4] 2> 489461 INFO
(zkCallback-905-thread-3-processing-n:127.0.0.1:39407_solr)
[n:127.0.0.1:39407_solr ] o.a.s.c.c.ZkStateReader A cluster state change:
[WatchedEvent state:SyncConnected type:NodeDataChanged
path:/collections/testNodeAdded/state.json] for collection [testNodeAdded] has
occurred - updating... (live nodes size: [1])
[junit4] 2> 489461 INFO
(zkCallback-905-thread-1-processing-n:127.0.0.1:39407_solr)
[n:127.0.0.1:39407_solr ] o.a.s.c.c.ZkStateReader A cluster state change:
[WatchedEvent state:SyncConnected type:NodeDataChanged
path:/collections/testNodeAdded/state.json] for collection [testNodeAdded] has
occurred - updating... (live nodes size: [1])
[junit4] 2> 489914 DEBUG (ScheduledTrigger-1140-thread-2)
[n:127.0.0.1:39407_solr ] o.a.s.c.a.NodeAddedTrigger Running
NodeAddedTrigger node_added_trigger
[junit4] 2> 489914 DEBUG (ScheduledTrigger-1140-thread-2)
[n:127.0.0.1:39407_solr ] o.a.s.c.a.NodeAddedTrigger Found livenodes: 1
[junit4] 2> 490364 INFO (qtp1590159348-3374) [n:127.0.0.1:39407_solr ]
o.a.s.s.HttpSolrCall [admin] webapp=null path=/admin/collections
params={replicationFactor=2&collection.configName=conf&name=testNodeAdded&nrtReplicas=2&action=CREATE&numShards=1&wt=javabin&version=2}
status=0 QTime=3453
[junit4] 2> 490369 INFO (qtp1590159348-3378) [n:127.0.0.1:39407_solr ]
o.a.s.s.HttpSolrCall [admin] webapp=null path=/admin/metrics
params={wt=javabin&version=2&key=solr.core.testNodeAdded.shard1.replica_n1:INDEX.sizeInBytes&key=solr.core.testNodeAdded.shard1.replica_n2:INDEX.sizeInBytes}
status=0 QTime=0
[junit4] 2> 490371 INFO (qtp1590159348-3375) [n:127.0.0.1:39407_solr ]
o.a.s.s.HttpSolrCall [admin] webapp=null path=/admin/metrics
params={prefix=CONTAINER.fs.usableSpace,CORE.coreName&wt=javabin&version=2&group=solr.node,solr.core}
status=0 QTime=1
[junit4] 2> 490374 DEBUG (qtp1590159348-3372) [n:127.0.0.1:39407_solr ]
o.a.s.c.a.AutoScalingHandler Verified autoscaling configuration
[junit4] 2> 490374 INFO (qtp1590159348-3372) [n:127.0.0.1:39407_solr ]
o.a.s.s.HttpSolrCall [admin] webapp=null path=/cluster/autoscaling
params={wt=javabin&version=2} status=0 QTime=8
[junit4] 2> 490375 DEBUG
(zkCallback-905-thread-1-processing-n:127.0.0.1:39407_solr)
[n:127.0.0.1:39407_solr ] o.a.s.c.a.OverseerTriggerThread Refreshing
/autoscaling.json with znode version 7
[junit4] 2> 490375 DEBUG
(zkCallback-905-thread-1-processing-n:127.0.0.1:39407_solr)
[n:127.0.0.1:39407_solr ] o.a.s.c.a.NodeAddedTrigger Initial livenodes:
[127.0.0.1:39407_solr]
[junit4] 2> 490375 DEBUG
(zkCallback-905-thread-1-processing-n:127.0.0.1:39407_solr)
[n:127.0.0.1:39407_solr ] o.a.s.c.a.NodeAddedTrigger NodeAddedTrigger
node_added_trigger instantiated with properties: {event=nodeAdded, waitFor=1,
actions=[{name=compute_plan, class=solr.ComputePlanAction}, {name=test,
class=org.apache.solr.cloud.autoscaling.ComputePlanActionTest$AssertingTriggerAction}],
enabled=true}
[junit4] 2> 490376 INFO
(TEST-ComputePlanActionTest.testNodeAdded-seed#[43B9CF7079FA8FBB]) [ ]
o.e.j.s.Server jetty-9.4.8.v20171121, build timestamp:
2017-11-22T00:27:37+03:00, git hash: 82b8fb23f757335bb3329d540ce37a2a2615f0a8
[junit4] 2> 490376 DEBUG
(OverseerAutoScalingTriggerThread-73270130737807363-127.0.0.1:39407_solr-n_0000000000)
[n:127.0.0.1:39407_solr ] o.a.s.c.a.OverseerTriggerThread Processed trigger
updates upto znodeVersion 7
[junit4] 2> 490376 DEBUG
(OverseerAutoScalingTriggerThread-73270130737807363-127.0.0.1:39407_solr-n_0000000000)
[n:127.0.0.1:39407_solr ] o.a.s.c.a.OverseerTriggerThread -- clean old
nodeLost markers
[junit4] 2> 490376 DEBUG
(OverseerAutoScalingTriggerThread-73270130737807363-127.0.0.1:39407_solr-n_0000000000)
[n:127.0.0.1:39407_solr ] o.a.s.c.a.OverseerTriggerThread Current
znodeVersion 7, lastZnodeVersion 7
[junit4] 2> 490378 INFO
(TEST-ComputePlanActionTest.testNodeAdded-seed#[43B9CF7079FA8FBB]) [ ]
o.e.j.s.session DefaultSessionIdManager workerName=node0
[junit4] 2> 490378 INFO
(TEST-ComputePlanActionTest.testNodeAdded-seed#[43B9CF7079FA8FBB]) [ ]
o.e.j.s.session No SessionScavenger set, using defaults
[junit4] 2> 490378 INFO
(TEST-ComputePlanActionTest.testNodeAdded-seed#[43B9CF7079FA8FBB]) [ ]
o.e.j.s.session Scavenging every 600000ms
[junit4] 2> 490378 INFO
(TEST-ComputePlanActionTest.testNodeAdded-seed#[43B9CF7079FA8FBB]) [ ]
o.e.j.s.h.ContextHandler Started
o.e.j.s.ServletContextHandler@3c02d37e{/solr,null,AVAILABLE}
[junit4] 2> 490379 INFO
(TEST-ComputePlanActionTest.testNodeAdded-seed#[43B9CF7079FA8FBB]) [ ]
o.e.j.s.AbstractConnector Started ServerConnector@57cc42b2{SSL,[ssl,
http/1.1]}{127.0.0.1:50922}
[junit4] 2> 490379 INFO
(TEST-ComputePlanActionTest.testNodeAdded-seed#[43B9CF7079FA8FBB]) [ ]
o.e.j.s.Server Started @492594ms
[junit4] 2> 490379 INFO
(TEST-ComputePlanActionTest.testNodeAdded-seed#[43B9CF7079FA8FBB]) [ ]
o.a.s.c.s.e.JettySolrRunner Jetty properties: {hostContext=/solr,
hostPort=50922}
[junit4] 2> 490379 ERROR
(TEST-ComputePlanActionTest.testNodeAdded-seed#[43B9CF7079FA8FBB]) [ ]
o.a.s.u.StartupLoggingUtils Missing Java Option solr.log.dir. Logging may be
missing or incomplete.
[junit4] 2> 490380 INFO
(TEST-ComputePlanActionTest.testNodeAdded-seed#[43B9CF7079FA8FBB]) [ ]
o.a.s.s.SolrDispatchFilter ___ _ Welcome to Apache Solr? version
8.0.0
[junit4] 2> 490380 INFO
(TEST-ComputePlanActionTest.testNodeAdded-seed#[43B9CF7079FA8FBB]) [ ]
o.a.s.s.SolrDispatchFilter / __| ___| |_ _ Starting in cloud mode on port null
[junit4] 2> 490380 INFO
(TEST-ComputePlanActionTest.testNodeAdded-seed#[43B9CF7079FA8FBB]) [ ]
o.a.s.s.SolrDispatchFilter \__ \/ _ \ | '_| Install dir: null
[junit4] 2> 490380 INFO
(TEST-ComputePlanActionTest.testNodeAdded-seed#[43B9CF7079FA8FBB]) [ ]
o.a.s.s.SolrDispatchFilter |___/\___/_|_| Start time:
2018-02-10T08:05:35.007Z
[junit4] 2> 490382 INFO (zkConnectionManagerCallback-917-thread-1) [ ]
o.a.s.c.c.ConnectionManager zkClient has connected
[junit4] 2> 490382 INFO
(TEST-ComputePlanActionTest.testNodeAdded-seed#[43B9CF7079FA8FBB]) [ ]
o.a.s.s.SolrDispatchFilter solr.xml found in ZooKeeper. Loading...
[junit4] 2> 490402 INFO
(TEST-ComputePlanActionTest.testNodeAdded-seed#[43B9CF7079FA8FBB]) [ ]
o.a.s.c.ZkContainer Zookeeper client=127.0.0.1:45473/solr
[junit4] 2> 490407 INFO (zkConnectionManagerCallback-921-thread-1) [ ]
o.a.s.c.c.ConnectionManager zkClient has connected
[junit4] 2> 490410 INFO
(zkConnectionManagerCallback-923-thread-1-processing-n:127.0.0.1:50922_solr)
[n:127.0.0.1:50922_solr ] o.a.s.c.c.ConnectionManager zkClient has connected
[junit4] 2> 490422 INFO
(TEST-ComputePlanActionTest.testNodeAdded-seed#[43B9CF7079FA8FBB])
[n:127.0.0.1:50922_solr ] o.a.s.c.c.ZkStateReader Updated live nodes from
ZooKeeper... (0) -> (1)
[junit4] 2> 490424 INFO
(TEST-ComputePlanActionTest.testNodeAdded-seed#[43B9CF7079FA8FBB])
[n:127.0.0.1:50922_solr ] o.a.s.c.Overseer Overseer (id=null) closing
[junit4] 2> 490429 INFO
(TEST-ComputePlanActionTest.testNodeAdded-seed#[43B9CF7079FA8FBB])
[n:127.0.0.1:50922_solr ] o.a.s.c.ZkController Register node as live in
ZooKeeper:/live_nodes/127.0.0.1:50922_solr
[junit4] 2> 490430 DEBUG
(OverseerStateUpdate-73270130737807363-127.0.0.1:39407_solr-n_0000000000)
[n:127.0.0.1:39407_solr ] o.a.s.c.Overseer processMessage: queueSize: 1,
message = {
[junit4] 2> "operation":"downnode",
[junit4] 2> "node_name":"127.0.0.1:50922_solr"} current state version: 0
[junit4] 2> 490430 DEBUG
(OverseerStateUpdate-73270130737807363-127.0.0.1:39407_solr-n_0000000000)
[n:127.0.0.1:39407_solr ] o.a.s.c.o.NodeMutator DownNode state invoked for
node: 127.0.0.1:50922_solr
[junit4] 2> 490430 INFO
(zkCallback-905-thread-1-processing-n:127.0.0.1:39407_solr)
[n:127.0.0.1:39407_solr ] o.a.s.c.c.ZkStateReader Updated live nodes from
ZooKeeper... (1) -> (2)
[junit4] 2> 490430 INFO (zkCallback-913-thread-1) [ ]
o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (1) -> (2)
[junit4] 2> 490431 INFO (zkCallback-913-thread-2) [ ]
o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (1) -> (2)
[junit4] 2> 490431 INFO
(zkCallback-922-thread-1-processing-n:127.0.0.1:50922_solr)
[n:127.0.0.1:50922_solr ] o.a.s.c.c.ZkStateReader Updated live nodes from
ZooKeeper... (1) -> (2)
[junit4] 2> 490537 INFO
(TEST-ComputePlanActionTest.testNodeAdded-seed#[43B9CF7079FA8FBB])
[n:127.0.0.1:50922_solr ] o.a.s.m.r.SolrJmxReporter JMX monitoring for
'solr_50922.solr.node' (registry 'solr.node') enabled at server:
com.sun.jmx.mbeanserver.JmxMBeanServer@7bb3a730
[junit4] 2> 490544 INFO
(TEST-ComputePlanActionTest.testNodeAdded-seed#[43B9CF7079FA8FBB])
[n:127.0.0.1:50922_solr ] o.a.s.m.r.SolrJmxReporter JMX monitoring for
'solr_50922.solr.jvm' (registry 'solr.jvm') enabled at server:
com.sun.jmx.mbeanserver.JmxMBeanServer@7bb3a730
[junit4] 2> 490545 INFO
(TEST-ComputePlanActionTest.testNodeAdded-seed#[43B9CF7079FA8FBB])
[n:127.0.0.1:50922_solr ] o.a.s.m.r.SolrJmxReporter JMX monitoring for
'solr_50922.solr.jetty' (re
[...truncated too long message...]
terms/shard3
[junit4] 2> 3 /solr/collections/testSimple3/terms/shard2
[junit4] 2> 3 /solr/collections/testSimple3/terms/shard1
[junit4] 2>
[junit4] 2> Maximum concurrent data watches above limit:
[junit4] 2>
[junit4] 2> 27 /solr/collections/testSimple1/state.json
[junit4] 2> 14 /solr/collections/testSimple2/state.json
[junit4] 2> 10 /solr/collections/testSimple3/state.json
[junit4] 2> 5 /solr/clusterprops.json
[junit4] 2> 5 /solr/clusterstate.json
[junit4] 2> 3 /solr/autoscaling.json
[junit4] 2> 2
/solr/collections/testSimple1/leader_elect/shard1/election/73270289685544968-core_node5-n_0000000000
[junit4] 2>
[junit4] 2> Maximum concurrent children watches above limit:
[junit4] 2>
[junit4] 2> 5 /solr/live_nodes
[junit4] 2> 5 /solr/collections
[junit4] 2> 3 /solr/overseer/queue
[junit4] 2> 3 /solr/overseer/collection-queue-work
[junit4] 2> 3 /solr/overseer/queue-work
[junit4] 2> 2 /solr/autoscaling/events/.auto_add_replicas
[junit4] 2>
[junit4] 2> 3056695 WARN
(SUITE-HdfsAutoAddReplicasIntegrationTest-seed#[43B9CF7079FA8FBB]-worker) [
] o.a.h.h.s.d.DirectoryScanner DirectoryScanner: shutdown has been called
[junit4] 2> 3056710 INFO
(SUITE-HdfsAutoAddReplicasIntegrationTest-seed#[43B9CF7079FA8FBB]-worker) [
] o.m.log Stopped HttpServer2$SelectChannelConnectorWithSafeStartup@localhost:0
[junit4] 2> 3056811 WARN (DataNode:
[[[DISK]file:/x1/jenkins/jenkins-slave/workspace/Lucene-Solr-Tests-master/solr/build/solr-core/test/J0/temp/solr.cloud.autoscaling.HdfsAutoAddReplicasIntegrationTest_43B9CF7079FA8FBB-001/tempDir-002/hdfsBaseDir/data/data3/,
[DISK]file:/x1/jenkins/jenkins-slave/workspace/Lucene-Solr-Tests-master/solr/build/solr-core/test/J0/temp/solr.cloud.autoscaling.HdfsAutoAddReplicasIntegrationTest_43B9CF7079FA8FBB-001/tempDir-002/hdfsBaseDir/data/data4/]]
heartbeating to localhost/127.0.0.1:60465) [ ]
o.a.h.h.s.d.IncrementalBlockReportManager IncrementalBlockReportManager
interrupted
[junit4] 2> 3056811 WARN (DataNode:
[[[DISK]file:/x1/jenkins/jenkins-slave/workspace/Lucene-Solr-Tests-master/solr/build/solr-core/test/J0/temp/solr.cloud.autoscaling.HdfsAutoAddReplicasIntegrationTest_43B9CF7079FA8FBB-001/tempDir-002/hdfsBaseDir/data/data3/,
[DISK]file:/x1/jenkins/jenkins-slave/workspace/Lucene-Solr-Tests-master/solr/build/solr-core/test/J0/temp/solr.cloud.autoscaling.HdfsAutoAddReplicasIntegrationTest_43B9CF7079FA8FBB-001/tempDir-002/hdfsBaseDir/data/data4/]]
heartbeating to localhost/127.0.0.1:60465) [ ] o.a.h.h.s.d.DataNode Ending
block pool service for: Block pool BP-183711869-10.41.0.5-1518252356855
(Datanode Uuid f85330b1-85de-40ce-b2bf-2dd468c19e60) service to
localhost/127.0.0.1:60465
[junit4] 2> 3056819 WARN
(SUITE-HdfsAutoAddReplicasIntegrationTest-seed#[43B9CF7079FA8FBB]-worker) [
] o.a.h.h.s.d.DirectoryScanner DirectoryScanner: shutdown has been called
[junit4] 2> 3056840 INFO
(SUITE-HdfsAutoAddReplicasIntegrationTest-seed#[43B9CF7079FA8FBB]-worker) [
] o.m.log Stopped HttpServer2$SelectChannelConnectorWithSafeStartup@localhost:0
[junit4] 2> 3056942 WARN (DataNode:
[[[DISK]file:/x1/jenkins/jenkins-slave/workspace/Lucene-Solr-Tests-master/solr/build/solr-core/test/J0/temp/solr.cloud.autoscaling.HdfsAutoAddReplicasIntegrationTest_43B9CF7079FA8FBB-001/tempDir-002/hdfsBaseDir/data/data1/,
[DISK]file:/x1/jenkins/jenkins-slave/workspace/Lucene-Solr-Tests-master/solr/build/solr-core/test/J0/temp/solr.cloud.autoscaling.HdfsAutoAddReplicasIntegrationTest_43B9CF7079FA8FBB-001/tempDir-002/hdfsBaseDir/data/data2/]]
heartbeating to localhost/127.0.0.1:60465) [ ]
o.a.h.h.s.d.IncrementalBlockReportManager IncrementalBlockReportManager
interrupted
[junit4] 2> 3056942 WARN (DataNode:
[[[DISK]file:/x1/jenkins/jenkins-slave/workspace/Lucene-Solr-Tests-master/solr/build/solr-core/test/J0/temp/solr.cloud.autoscaling.HdfsAutoAddReplicasIntegrationTest_43B9CF7079FA8FBB-001/tempDir-002/hdfsBaseDir/data/data1/,
[DISK]file:/x1/jenkins/jenkins-slave/workspace/Lucene-Solr-Tests-master/solr/build/solr-core/test/J0/temp/solr.cloud.autoscaling.HdfsAutoAddReplicasIntegrationTest_43B9CF7079FA8FBB-001/tempDir-002/hdfsBaseDir/data/data2/]]
heartbeating to localhost/127.0.0.1:60465) [ ] o.a.h.h.s.d.DataNode Ending
block pool service for: Block pool BP-183711869-10.41.0.5-1518252356855
(Datanode Uuid 5a7bc5de-a63a-47a0-81d4-87a78cc01ed8) service to
localhost/127.0.0.1:60465
[junit4] 2> 3056960 INFO
(SUITE-HdfsAutoAddReplicasIntegrationTest-seed#[43B9CF7079FA8FBB]-worker) [
] o.m.log Stopped HttpServer2$SelectChannelConnectorWithSafeStartup@localhost:0
[junit4] 2> 3057115 INFO
(SUITE-HdfsAutoAddReplicasIntegrationTest-seed#[43B9CF7079FA8FBB]-worker) [
] o.a.s.c.ZkTestServer connecting to 127.0.0.1:55635 55635
[junit4] 2> NOTE: leaving temporary files on disk at:
/x1/jenkins/jenkins-slave/workspace/Lucene-Solr-Tests-master/solr/build/solr-core/test/J0/temp/solr.cloud.autoscaling.HdfsAutoAddReplicasIntegrationTest_43B9CF7079FA8FBB-001
[junit4] 2> Feb 10, 2018 8:48:22 AM
com.carrotsearch.randomizedtesting.ThreadLeakControl checkThreadLeaks
[junit4] 2> WARNING: Will linger awaiting termination of 35 leaked
thread(s).
[junit4] 2> NOTE: test params are: codec=Lucene70,
sim=Asserting(org.apache.lucene.search.similarities.AssertingSimilarity@5165a017),
locale=lt-LT, timezone=America/St_Kitts
[junit4] 2> NOTE: Linux 3.13.0-88-generic amd64/Oracle Corporation
1.8.0_144 (64-bit)/cpus=4,threads=2,free=208985440,total=517996544
[junit4] 2> NOTE: All tests run in this JVM: [TestFastOutputStream,
TestCloudManagedSchema, TestRestoreCore,
SuggestComponentContextFilterQueryTest, TestBackupRepositoryFactory,
TestCoreAdminApis, OverseerStatusTest, TestUseDocValuesAsStored2,
ImplicitSnitchTest, BlockJoinFacetDistribTest, SharedFSAutoReplicaFailoverTest,
TestHdfsCloudBackupRestore, TestQuerySenderNoQuery, TestExactSharedStatsCache,
SecurityConfHandlerTest, TestIndexSearcher, TestDynamicFieldResource,
MetricsConfigTest, TestMergePolicyConfig, TestCloudInspectUtil,
CdcrBidirectionalTest, ExplicitHLLTest, ZkSolrClientTest,
TestClusterProperties, IndexBasedSpellCheckerTest, TestNumericTokenStream,
DataDrivenBlockJoinTest, RecoveryAfterSoftCommitTest, TestDFISimilarityFactory,
SimpleCollectionCreateDeleteTest, DistributedFacetPivotWhiteBoxTest,
HDFSCollectionsAPITest, ChaosMonkeySafeLeaderWithPullReplicasTest,
SimpleFacetsTest, BlobRepositoryCloudTest, TestComponentsName,
TestSearcherReuse, TestNodeAddedTrigger, SolrXmlInZkTest,
TestObjectReleaseTracker, TestDocumentBuilder, TestXmlQParser,
SolrSlf4jReporterTest, TestComplexPhraseQParserPlugin, TestSolrDeletionPolicy1,
BadIndexSchemaTest, TestApiFramework, ConfigureRecoveryStrategyTest,
VMParamsZkACLAndCredentialsProvidersTest, TestBlobHandler,
TestSolrConfigHandlerCloud, TestAuthorizationFramework, TestCSVLoader,
CurrencyRangeFacetCloudTest, CdcrReplicationHandlerTest,
TestHighlightDedupGrouping, HLLUtilTest, TestLuceneMatchVersion,
SolrPluginUtilsTest, TestShortCircuitedRequests, OpenCloseCoreStressTest,
CollectionsAPIAsyncDistributedZkTest, TestPushWriter,
DefaultValueUpdateProcessorTest, TestCSVResponseWriter,
TestSerializedLuceneMatchVersion, TestPseudoReturnFields, V2ApiIntegrationTest,
BasicAuthIntegrationTest, IgnoreCommitOptimizeUpdateProcessorFactoryTest,
TestMissingGroups, TestManagedSynonymFilterFactory, TestMacros,
HdfsRecoverLeaseTest, SolrGraphiteReporterTest, DateRangeFieldTest,
TestManagedResource, TestPrepRecovery, RegexBytesRefFilterTest,
ClassificationUpdateProcessorTest, MigrateRouteKeyTest,
TimeRoutedAliasUpdateProcessorTest, TestBinaryField, BasicDistributedZkTest,
TestRandomFaceting, HighlighterConfigTest, TestClusterStateMutator,
TestCollationField, ZkCLITest, TestGroupingSearch,
BigEndianAscendingWordDeserializerTest, TestInfoStreamLogging,
CloudExitableDirectoryReaderTest, RequestHandlersTest,
TestInPlaceUpdatesDistrib, XmlUpdateRequestHandlerTest, TestPhraseSuggestions,
ReplicaListTransformerTest, TestAnalyzeInfixSuggestions,
TermVectorComponentDistributedTest, TestOrdValues, TestCustomStream,
DistributedExpandComponentTest, AssignTest,
DistribDocExpirationUpdateProcessorTest, TestRequestForwarding,
TestSchemaResource, DistributedSuggestComponentTest,
TestEmbeddedSolrServerSchemaAPI, TestCrossCoreJoin, UUIDFieldTest,
TestRetrieveFieldsOptimizer, TestOverriddenPrefixQueryForCustomFieldType,
ZkNodePropsTest, NodeMutatorTest, DocumentAnalysisRequestHandlerTest,
ExternalFileFieldSortTest, SystemLogListenerTest, CloudMLTQParserTest,
VersionInfoTest, SolrMetricReporterTest, FieldAnalysisRequestHandlerTest,
DeleteShardTest, TestReloadAndDeleteDocs, TestQueryWrapperFilter,
TestFieldCacheVsDocValues, ShardRoutingTest, ConcurrentCreateRoutedAliasTest,
CreateCollectionCleanupTest, CreateRoutedAliasTest, DistribCursorPagingTest,
DistributedQueueTest, DocValuesNotIndexedTest, HealthCheckHandlerTest,
HttpPartitionOnCommitTest, LeaderElectionContextKeyTest,
LeaderFailoverAfterPartitionTest, LegacyCloudClusterPropTest,
MoveReplicaHDFSFailoverTest, MoveReplicaTest,
OutOfBoxZkACLAndCredentialsProvidersTest,
OverriddenZkACLAndCredentialsProvidersTest,
OverseerCollectionConfigSetProcessorTest, OverseerModifyCollectionTest,
OverseerTaskQueueTest, PeerSyncReplicationTest, SolrCLIZkUtilsTest,
TestCloudJSONFacetJoinDomain, TestConfigSetsAPIExclusivity,
TestConfigSetsAPIZkFailure, TestDistribDocBasedVersion,
TestLeaderElectionWithEmptyReplica, TestLockTree, TestMiniSolrCloudClusterSSL,
TestPullReplicaErrorHandling, TestRandomFlRTGCloud, TestRebalanceLeaders,
TestSolrCloudWithDelegationTokens, TestSolrCloudWithKerberosAlt,
TestTlogReplica, CustomCollectionTest, TestCollectionAPI,
TestRequestStatusCollectionAPI, HdfsAutoAddReplicasIntegrationTest]
[junit4] Completed [582/775 (4!)] on J0 in 155.65s, 1 test, 1 failure <<<
FAILURES!
[...truncated 48748 lines...]
---------------------------------------------------------------------
To unsubscribe, e-mail: [email protected]
For additional commands, e-mail: [email protected]