Build: https://jenkins.thetaphi.de/job/Lucene-Solr-8.x-Windows/1696/
Java: 64bit/jdk-13.0.2 -XX:+UseCompressedOops -XX:+UseG1GC
2 tests failed.
FAILED: org.apache.solr.cloud.MultiThreadedOCPTest.test
Error Message:
acoll: 1601862268189 bcoll: 1601862268242
Stack Trace:
java.lang.AssertionError: acoll: 1601862268189 bcoll: 1601862268242
at
__randomizedtesting.SeedInfo.seed([DEE62991148E9A5B:56B2164BBA72F7A3]:0)
at org.junit.Assert.fail(Assert.java:88)
at org.junit.Assert.assertTrue(Assert.java:41)
at
org.apache.solr.cloud.MultiThreadedOCPTest.testFillWorkQueue(MultiThreadedOCPTest.java:113)
at
org.apache.solr.cloud.MultiThreadedOCPTest.test(MultiThreadedOCPTest.java:68)
at
java.base/jdk.internal.reflect.NativeMethodAccessorImpl.invoke0(Native Method)
at
java.base/jdk.internal.reflect.NativeMethodAccessorImpl.invoke(NativeMethodAccessorImpl.java:62)
at
java.base/jdk.internal.reflect.DelegatingMethodAccessorImpl.invoke(DelegatingMethodAccessorImpl.java:43)
at java.base/java.lang.reflect.Method.invoke(Method.java:567)
at
com.carrotsearch.randomizedtesting.RandomizedRunner.invoke(RandomizedRunner.java:1750)
at
com.carrotsearch.randomizedtesting.RandomizedRunner$8.evaluate(RandomizedRunner.java:938)
at
com.carrotsearch.randomizedtesting.RandomizedRunner$9.evaluate(RandomizedRunner.java:974)
at
com.carrotsearch.randomizedtesting.RandomizedRunner$10.evaluate(RandomizedRunner.java:988)
at
org.apache.solr.BaseDistributedSearchTestCase$ShardsRepeatRule$ShardsFixedStatement.callStatement(BaseDistributedSearchTestCase.java:1090)
at
org.apache.solr.BaseDistributedSearchTestCase$ShardsRepeatRule$ShardsStatement.evaluate(BaseDistributedSearchTestCase.java:1061)
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:947)
at
com.carrotsearch.randomizedtesting.RandomizedRunner$5.evaluate(RandomizedRunner.java:832)
at
com.carrotsearch.randomizedtesting.RandomizedRunner$6.evaluate(RandomizedRunner.java:883)
at
com.carrotsearch.randomizedtesting.RandomizedRunner$7.evaluate(RandomizedRunner.java:894)
at
com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
at
com.carrotsearch.randomizedtesting.rules.SystemPropertiesRestoreRule$1.evaluate(SystemPropertiesRestoreRule.java:57)
at
org.apache.lucene.util.AbstractBeforeAfterRule$1.evaluate(AbstractBeforeAfterRule.java:45)
at
com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
at
org.apache.lucene.util.TestRuleStoreClassName$1.evaluate(TestRuleStoreClassName.java:41)
at
com.carrotsearch.randomizedtesting.rules.NoShadowingOrOverridesOnMethodsRule$1.evaluate(NoShadowingOrOverridesOnMethodsRule.java:40)
at
com.carrotsearch.randomizedtesting.rules.NoShadowingOrOverridesOnMethodsRule$1.evaluate(NoShadowingOrOverridesOnMethodsRule.java:40)
at
com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
at
com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
at
org.apache.lucene.util.TestRuleAssertionsRequired$1.evaluate(TestRuleAssertionsRequired.java:53)
at
org.apache.lucene.util.TestRuleMarkFailure$1.evaluate(TestRuleMarkFailure.java:47)
at
org.apache.lucene.util.TestRuleIgnoreAfterMaxFailures$1.evaluate(TestRuleIgnoreAfterMaxFailures.java:64)
at
org.apache.lucene.util.TestRuleIgnoreTestSuites$1.evaluate(TestRuleIgnoreTestSuites.java:54)
at
com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
at
com.carrotsearch.randomizedtesting.ThreadLeakControl$StatementRunner.run(ThreadLeakControl.java:368)
at java.base/java.lang.Thread.run(Thread.java:830)
FAILED: org.apache.solr.cloud.MultiThreadedOCPTest.test
Error Message:
acoll: 1601858544557 bcoll: 1601858544606
Stack Trace:
java.lang.AssertionError: acoll: 1601858544557 bcoll: 1601858544606
at
__randomizedtesting.SeedInfo.seed([DEE62991148E9A5B:56B2164BBA72F7A3]:0)
at org.junit.Assert.fail(Assert.java:88)
at org.junit.Assert.assertTrue(Assert.java:41)
at
org.apache.solr.cloud.MultiThreadedOCPTest.testFillWorkQueue(MultiThreadedOCPTest.java:113)
at
org.apache.solr.cloud.MultiThreadedOCPTest.test(MultiThreadedOCPTest.java:68)
at
java.base/jdk.internal.reflect.NativeMethodAccessorImpl.invoke0(Native Method)
at
java.base/jdk.internal.reflect.NativeMethodAccessorImpl.invoke(NativeMethodAccessorImpl.java:62)
at
java.base/jdk.internal.reflect.DelegatingMethodAccessorImpl.invoke(DelegatingMethodAccessorImpl.java:43)
at java.base/java.lang.reflect.Method.invoke(Method.java:567)
at
com.carrotsearch.randomizedtesting.RandomizedRunner.invoke(RandomizedRunner.java:1750)
at
com.carrotsearch.randomizedtesting.RandomizedRunner$8.evaluate(RandomizedRunner.java:938)
at
com.carrotsearch.randomizedtesting.RandomizedRunner$9.evaluate(RandomizedRunner.java:974)
at
com.carrotsearch.randomizedtesting.RandomizedRunner$10.evaluate(RandomizedRunner.java:988)
at
org.apache.solr.BaseDistributedSearchTestCase$ShardsRepeatRule$ShardsFixedStatement.callStatement(BaseDistributedSearchTestCase.java:1090)
at
org.apache.solr.BaseDistributedSearchTestCase$ShardsRepeatRule$ShardsStatement.evaluate(BaseDistributedSearchTestCase.java:1061)
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:947)
at
com.carrotsearch.randomizedtesting.RandomizedRunner$5.evaluate(RandomizedRunner.java:832)
at
com.carrotsearch.randomizedtesting.RandomizedRunner$6.evaluate(RandomizedRunner.java:883)
at
com.carrotsearch.randomizedtesting.RandomizedRunner$7.evaluate(RandomizedRunner.java:894)
at
com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
at
com.carrotsearch.randomizedtesting.rules.SystemPropertiesRestoreRule$1.evaluate(SystemPropertiesRestoreRule.java:57)
at
org.apache.lucene.util.AbstractBeforeAfterRule$1.evaluate(AbstractBeforeAfterRule.java:45)
at
com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
at
org.apache.lucene.util.TestRuleStoreClassName$1.evaluate(TestRuleStoreClassName.java:41)
at
com.carrotsearch.randomizedtesting.rules.NoShadowingOrOverridesOnMethodsRule$1.evaluate(NoShadowingOrOverridesOnMethodsRule.java:40)
at
com.carrotsearch.randomizedtesting.rules.NoShadowingOrOverridesOnMethodsRule$1.evaluate(NoShadowingOrOverridesOnMethodsRule.java:40)
at
com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
at
com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
at
org.apache.lucene.util.TestRuleAssertionsRequired$1.evaluate(TestRuleAssertionsRequired.java:53)
at
org.apache.lucene.util.TestRuleMarkFailure$1.evaluate(TestRuleMarkFailure.java:47)
at
org.apache.lucene.util.TestRuleIgnoreAfterMaxFailures$1.evaluate(TestRuleIgnoreAfterMaxFailures.java:64)
at
org.apache.lucene.util.TestRuleIgnoreTestSuites$1.evaluate(TestRuleIgnoreTestSuites.java:54)
at
com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
at
com.carrotsearch.randomizedtesting.ThreadLeakControl$StatementRunner.run(ThreadLeakControl.java:368)
at java.base/java.lang.Thread.run(Thread.java:830)
Build Log:
[...truncated 13666 lines...]
[junit4] Suite: org.apache.solr.cloud.MultiThreadedOCPTest
[junit4] 2> 120852 INFO
(SUITE-MultiThreadedOCPTest-seed#[DEE62991148E9A5B]-worker) [ ]
o.a.s.SolrTestCase Setting 'solr.default.confdir' system property to
test-framework derived value of
'C:\Users\jenkins\workspace\Lucene-Solr-8.x-Windows\solr\server\solr\configsets\_default\conf'
[junit4] 2> 120852 INFO
(SUITE-MultiThreadedOCPTest-seed#[DEE62991148E9A5B]-worker) [ ]
o.a.s.SolrTestCaseJ4 SecureRandom sanity checks:
test.solr.allowed.securerandom=null & java.security.egd=file:/dev/./urandom
[junit4] 2> 120854 INFO
(SUITE-MultiThreadedOCPTest-seed#[DEE62991148E9A5B]-worker) [ ]
o.a.s.SolrTestCaseJ4 Created dataDir:
C:\Users\jenkins\workspace\Lucene-Solr-8.x-Windows\solr\build\solr-core\test\J1\temp\solr.cloud.MultiThreadedOCPTest_DEE62991148E9A5B-001\data-dir-6-001
[junit4] 2> 120854 WARN
(SUITE-MultiThreadedOCPTest-seed#[DEE62991148E9A5B]-worker) [ ]
o.a.s.SolrTestCaseJ4 startTrackingSearchers: numOpens=25 numCloses=25
[junit4] 2> 120856 INFO
(SUITE-MultiThreadedOCPTest-seed#[DEE62991148E9A5B]-worker) [ ]
o.a.s.SolrTestCaseJ4 Using PointFields (NUMERIC_POINTS_SYSPROP=true)
w/NUMERIC_DOCVALUES_SYSPROP=true
[junit4] 2> 120856 INFO
(SUITE-MultiThreadedOCPTest-seed#[DEE62991148E9A5B]-worker) [ ]
o.a.s.SolrTestCaseJ4 Randomized ssl (false) and clientAuth (false) via:
@org.apache.solr.util.RandomizeSSL(reason="", value=0.0/0.0, ssl=0.0/0.0,
clientAuth=0.0/0.0)
[junit4] 2> 120856 INFO
(SUITE-MultiThreadedOCPTest-seed#[DEE62991148E9A5B]-worker) [ ]
o.a.s.BaseDistributedSearchTestCase Setting hostContext system property: /
[junit4] 2> 120862 INFO
(TEST-MultiThreadedOCPTest.test-seed#[DEE62991148E9A5B]) [ ]
o.a.s.c.ZkTestServer STARTING ZK TEST SERVER
[junit4] 2> 120862 INFO (ZkTestServer Run Thread) [ ]
o.a.s.c.ZkTestServer client port: 0.0.0.0/0.0.0.0:0
[junit4] 2> 120862 INFO (ZkTestServer Run Thread) [ ]
o.a.s.c.ZkTestServer Starting server
[junit4] 2> 120864 WARN (ZkTestServer Run Thread) [ ]
o.a.z.s.ServerCnxnFactory maxCnxns is not configured, using default value 0.
[junit4] 2> 120974 INFO
(TEST-MultiThreadedOCPTest.test-seed#[DEE62991148E9A5B]) [ ]
o.a.s.c.ZkTestServer start zk server on port: 64469
[junit4] 2> 120974 INFO
(TEST-MultiThreadedOCPTest.test-seed#[DEE62991148E9A5B]) [ ]
o.a.s.c.ZkTestServer waitForServerUp: 127.0.0.1:64469
[junit4] 2> 120974 INFO
(TEST-MultiThreadedOCPTest.test-seed#[DEE62991148E9A5B]) [ ]
o.a.s.c.ZkTestServer parse host and port list: 127.0.0.1:64469
[junit4] 2> 120974 INFO
(TEST-MultiThreadedOCPTest.test-seed#[DEE62991148E9A5B]) [ ]
o.a.s.c.ZkTestServer connecting to 127.0.0.1 64469
[junit4] 2> 120975 INFO
(TEST-MultiThreadedOCPTest.test-seed#[DEE62991148E9A5B]) [ ]
o.a.s.c.c.ConnectionManager Waiting for client to connect to ZooKeeper
[junit4] 2> 120985 INFO (zkConnectionManagerCallback-1465-thread-1) [
] o.a.s.c.c.ConnectionManager zkClient has connected
[junit4] 2> 120985 INFO
(TEST-MultiThreadedOCPTest.test-seed#[DEE62991148E9A5B]) [ ]
o.a.s.c.c.ConnectionManager Client is connected to ZooKeeper
[junit4] 2> 120992 INFO
(TEST-MultiThreadedOCPTest.test-seed#[DEE62991148E9A5B]) [ ]
o.a.s.c.c.ConnectionManager Waiting for client to connect to ZooKeeper
[junit4] 2> 121002 INFO (zkConnectionManagerCallback-1467-thread-1) [
] o.a.s.c.c.ConnectionManager zkClient has connected
[junit4] 2> 121002 INFO
(TEST-MultiThreadedOCPTest.test-seed#[DEE62991148E9A5B]) [ ]
o.a.s.c.c.ConnectionManager Client is connected to ZooKeeper
[junit4] 2> 121010 INFO
(TEST-MultiThreadedOCPTest.test-seed#[DEE62991148E9A5B]) [ ]
o.a.s.c.ZkTestServer put
C:\Users\jenkins\workspace\Lucene-Solr-8.x-Windows\solr\core\src\test-files\solr\collection1\conf\solrconfig-tlog.xml
to /configs/conf1/solrconfig.xml
[junit4] 2> 121017 INFO
(TEST-MultiThreadedOCPTest.test-seed#[DEE62991148E9A5B]) [ ]
o.a.s.c.ZkTestServer put
C:\Users\jenkins\workspace\Lucene-Solr-8.x-Windows\solr\core\src\test-files\solr\collection1\conf\schema.xml
to /configs/conf1/schema.xml
[junit4] 2> 121023 INFO
(TEST-MultiThreadedOCPTest.test-seed#[DEE62991148E9A5B]) [ ]
o.a.s.c.ZkTestServer put
C:\Users\jenkins\workspace\Lucene-Solr-8.x-Windows\solr\core\src\test-files\solr\collection1\conf\solrconfig.snippet.randomindexconfig.xml
to /configs/conf1/solrconfig.snippet.randomindexconfig.xml
[junit4] 2> 121032 INFO
(TEST-MultiThreadedOCPTest.test-seed#[DEE62991148E9A5B]) [ ]
o.a.s.c.ZkTestServer put
C:\Users\jenkins\workspace\Lucene-Solr-8.x-Windows\solr\core\src\test-files\solr\collection1\conf\stopwords.txt
to /configs/conf1/stopwords.txt
[junit4] 2> 121038 INFO
(TEST-MultiThreadedOCPTest.test-seed#[DEE62991148E9A5B]) [ ]
o.a.s.c.ZkTestServer put
C:\Users\jenkins\workspace\Lucene-Solr-8.x-Windows\solr\core\src\test-files\solr\collection1\conf\protwords.txt
to /configs/conf1/protwords.txt
[junit4] 2> 121043 INFO
(TEST-MultiThreadedOCPTest.test-seed#[DEE62991148E9A5B]) [ ]
o.a.s.c.ZkTestServer put
C:\Users\jenkins\workspace\Lucene-Solr-8.x-Windows\solr\core\src\test-files\solr\collection1\conf\currency.xml
to /configs/conf1/currency.xml
[junit4] 2> 121049 INFO
(TEST-MultiThreadedOCPTest.test-seed#[DEE62991148E9A5B]) [ ]
o.a.s.c.ZkTestServer put
C:\Users\jenkins\workspace\Lucene-Solr-8.x-Windows\solr\core\src\test-files\solr\collection1\conf\enumsConfig.xml
to /configs/conf1/enumsConfig.xml
[junit4] 2> 121054 INFO
(TEST-MultiThreadedOCPTest.test-seed#[DEE62991148E9A5B]) [ ]
o.a.s.c.ZkTestServer put
C:\Users\jenkins\workspace\Lucene-Solr-8.x-Windows\solr\core\src\test-files\solr\collection1\conf\open-exchange-rates.json
to /configs/conf1/open-exchange-rates.json
[junit4] 2> 121059 INFO
(TEST-MultiThreadedOCPTest.test-seed#[DEE62991148E9A5B]) [ ]
o.a.s.c.ZkTestServer put
C:\Users\jenkins\workspace\Lucene-Solr-8.x-Windows\solr\core\src\test-files\solr\collection1\conf\mapping-ISOLatin1Accent.txt
to /configs/conf1/mapping-ISOLatin1Accent.txt
[junit4] 2> 121065 INFO
(TEST-MultiThreadedOCPTest.test-seed#[DEE62991148E9A5B]) [ ]
o.a.s.c.ZkTestServer put
C:\Users\jenkins\workspace\Lucene-Solr-8.x-Windows\solr\core\src\test-files\solr\collection1\conf\old_synonyms.txt
to /configs/conf1/old_synonyms.txt
[junit4] 2> 121068 INFO
(TEST-MultiThreadedOCPTest.test-seed#[DEE62991148E9A5B]) [ ]
o.a.s.c.ZkTestServer put
C:\Users\jenkins\workspace\Lucene-Solr-8.x-Windows\solr\core\src\test-files\solr\collection1\conf\synonyms.txt
to /configs/conf1/synonyms.txt
[junit4] 2> 121075 INFO
(TEST-MultiThreadedOCPTest.test-seed#[DEE62991148E9A5B]) [ ]
o.a.s.c.AbstractFullDistribZkTestBase Will use NRT replicas unless explicitly
asked otherwise
[junit4] 2> 121712 WARN
(TEST-MultiThreadedOCPTest.test-seed#[DEE62991148E9A5B]) [ ]
o.e.j.s.h.g.GzipHandler minGzipSize of 0 is inefficient for short content,
break even is size 23
[junit4] 2> 121712 INFO
(TEST-MultiThreadedOCPTest.test-seed#[DEE62991148E9A5B]) [ ]
o.a.s.c.s.e.JettySolrRunner Start Jetty (configured port=0, binding port=0)
[junit4] 2> 121712 INFO
(TEST-MultiThreadedOCPTest.test-seed#[DEE62991148E9A5B]) [ ]
o.a.s.c.s.e.JettySolrRunner Trying to start Jetty on port 0 try number 2 ...
[junit4] 2> 121712 INFO
(TEST-MultiThreadedOCPTest.test-seed#[DEE62991148E9A5B]) [ ] o.e.j.s.Server
jetty-9.4.27.v20200227; built: 2020-02-27T18:37:21.340Z; git:
a304fd9f351f337e7c0e2a7c28878dd536149c6c; jvm 13.0.2+8
[junit4] 2> 121712 INFO
(TEST-MultiThreadedOCPTest.test-seed#[DEE62991148E9A5B]) [ ]
o.e.j.s.session DefaultSessionIdManager workerName=node0
[junit4] 2> 121712 INFO
(TEST-MultiThreadedOCPTest.test-seed#[DEE62991148E9A5B]) [ ]
o.e.j.s.session No SessionScavenger set, using defaults
[junit4] 2> 121712 INFO
(TEST-MultiThreadedOCPTest.test-seed#[DEE62991148E9A5B]) [ ]
o.e.j.s.session node0 Scavenging every 600000ms
[junit4] 2> 121712 INFO
(TEST-MultiThreadedOCPTest.test-seed#[DEE62991148E9A5B]) [ ]
o.e.j.s.h.ContextHandler Started
o.e.j.s.ServletContextHandler@470e15c9{/,null,AVAILABLE}
[junit4] 2> 121715 INFO
(TEST-MultiThreadedOCPTest.test-seed#[DEE62991148E9A5B]) [ ]
o.e.j.s.AbstractConnector Started ServerConnector@252ad3d8{HTTP/1.1, (http/1.1,
h2c)}{127.0.0.1:64485}
[junit4] 2> 121715 INFO
(TEST-MultiThreadedOCPTest.test-seed#[DEE62991148E9A5B]) [ ] o.e.j.s.Server
Started @121767ms
[junit4] 2> 121715 INFO
(TEST-MultiThreadedOCPTest.test-seed#[DEE62991148E9A5B]) [ ]
o.a.s.c.s.e.JettySolrRunner Jetty properties: {hostContext=/,
solr.data.dir=C:\Users\jenkins\workspace\Lucene-Solr-8.x-Windows\solr\build\solr-core\test\J1\temp\solr.cloud.MultiThreadedOCPTest_DEE62991148E9A5B-001\tempDir-001/control/data,
hostPort=64485,
coreRootDirectory=C:\Users\jenkins\workspace\Lucene-Solr-8.x-Windows\solr\build\solr-core\test\J1\..\..\..\..\..\..\..\..\..\Users\jenkins\workspace\Lucene-Solr-8.x-Windows\solr\build\solr-core\test\J1\temp\solr.cloud.MultiThreadedOCPTest_DEE62991148E9A5B-001\control-001\cores,
replicaType=NRT}
[junit4] 2> 121715 ERROR
(TEST-MultiThreadedOCPTest.test-seed#[DEE62991148E9A5B]) [ ]
o.a.s.u.StartupLoggingUtils Missing Java Option solr.log.dir. Logging may be
missing or incomplete.
[junit4] 2> 121715 INFO
(TEST-MultiThreadedOCPTest.test-seed#[DEE62991148E9A5B]) [ ]
o.a.s.s.SolrDispatchFilter Using logger factory
org.apache.logging.slf4j.Log4jLoggerFactory
[junit4] 2> 121715 INFO
(TEST-MultiThreadedOCPTest.test-seed#[DEE62991148E9A5B]) [ ]
o.a.s.s.SolrDispatchFilter ___ _ Welcome to Apache Solr? version
8.7.0
[junit4] 2> 121715 INFO
(TEST-MultiThreadedOCPTest.test-seed#[DEE62991148E9A5B]) [ ]
o.a.s.s.SolrDispatchFilter / __| ___| |_ _ Starting in cloud mode on port null
[junit4] 2> 121715 INFO
(TEST-MultiThreadedOCPTest.test-seed#[DEE62991148E9A5B]) [ ]
o.a.s.s.SolrDispatchFilter \__ \/ _ \ | '_| Install dir:
C:\Users\jenkins\workspace\Lucene-Solr-8.x-Windows\solr
[junit4] 2> 121715 INFO
(TEST-MultiThreadedOCPTest.test-seed#[DEE62991148E9A5B]) [ ]
o.a.s.s.SolrDispatchFilter |___/\___/_|_| Start time:
2020-10-05T00:41:37.144894700Z
[junit4] 2> 121715 INFO
(TEST-MultiThreadedOCPTest.test-seed#[DEE62991148E9A5B]) [ ]
o.a.s.c.c.ConnectionManager Waiting for client to connect to ZooKeeper
[junit4] 2> 121723 INFO (zkConnectionManagerCallback-1469-thread-1) [
] o.a.s.c.c.ConnectionManager zkClient has connected
[junit4] 2> 121723 INFO
(TEST-MultiThreadedOCPTest.test-seed#[DEE62991148E9A5B]) [ ]
o.a.s.c.c.ConnectionManager Client is connected to ZooKeeper
[junit4] 2> 121824 INFO
(TEST-MultiThreadedOCPTest.test-seed#[DEE62991148E9A5B]) [ ]
o.a.s.s.SolrDispatchFilter Loading solr.xml from SolrHome (not found in
ZooKeeper)
[junit4] 2> 121824 INFO
(TEST-MultiThreadedOCPTest.test-seed#[DEE62991148E9A5B]) [ ]
o.a.s.c.SolrXmlConfig Loading container configuration from
C:\Users\jenkins\workspace\Lucene-Solr-8.x-Windows\solr\build\solr-core\test\J1\..\..\..\..\..\..\..\..\..\Users\jenkins\workspace\Lucene-Solr-8.x-Windows\solr\build\solr-core\test\J1\temp\solr.cloud.MultiThreadedOCPTest_DEE62991148E9A5B-001\control-001\solr.xml
[junit4] 2> 121829 INFO
(TEST-MultiThreadedOCPTest.test-seed#[DEE62991148E9A5B]) [ ]
o.a.s.c.SolrXmlConfig Configuration parameter autoReplicaFailoverWorkLoopDelay
is ignored
[junit4] 2> 121829 INFO
(TEST-MultiThreadedOCPTest.test-seed#[DEE62991148E9A5B]) [ ]
o.a.s.c.SolrXmlConfig Configuration parameter
autoReplicaFailoverBadNodeExpiration is ignored
[junit4] 2> 121829 INFO
(TEST-MultiThreadedOCPTest.test-seed#[DEE62991148E9A5B]) [ ]
o.a.s.c.SolrXmlConfig MBean server found:
com.sun.jmx.mbeanserver.JmxMBeanServer@308db165, but no JMX reporters were
configured - adding default JMX reporter.
[junit4] 2> 122322 INFO
(TEST-MultiThreadedOCPTest.test-seed#[DEE62991148E9A5B]) [ ]
o.a.s.h.c.HttpShardHandlerFactory Host whitelist initialized:
WhitelistHostChecker [whitelistHosts=null, whitelistHostCheckingEnabled=false]
[junit4] 2> 122324 WARN
(TEST-MultiThreadedOCPTest.test-seed#[DEE62991148E9A5B]) [ ]
o.e.j.u.s.S.config Trusting all certificates configured for
Client@3d9612b5[provider=null,keyStore=null,trustStore=null]
[junit4] 2> 122324 WARN
(TEST-MultiThreadedOCPTest.test-seed#[DEE62991148E9A5B]) [ ]
o.e.j.u.s.S.config No Client EndPointIdentificationAlgorithm configured for
Client@3d9612b5[provider=null,keyStore=null,trustStore=null]
[junit4] 2> 122328 WARN
(TEST-MultiThreadedOCPTest.test-seed#[DEE62991148E9A5B]) [ ]
o.e.j.u.s.S.config Trusting all certificates configured for
Client@4989bdfd[provider=null,keyStore=null,trustStore=null]
[junit4] 2> 122328 WARN
(TEST-MultiThreadedOCPTest.test-seed#[DEE62991148E9A5B]) [ ]
o.e.j.u.s.S.config No Client EndPointIdentificationAlgorithm configured for
Client@4989bdfd[provider=null,keyStore=null,trustStore=null]
[junit4] 2> 122329 INFO
(TEST-MultiThreadedOCPTest.test-seed#[DEE62991148E9A5B]) [ ]
o.a.s.c.ZkContainer Zookeeper client=127.0.0.1:64469/solr
[junit4] 2> 122330 INFO
(TEST-MultiThreadedOCPTest.test-seed#[DEE62991148E9A5B]) [ ]
o.a.s.c.c.ConnectionManager Waiting for client to connect to ZooKeeper
[junit4] 2> 122335 INFO (zkConnectionManagerCallback-1479-thread-1) [
] o.a.s.c.c.ConnectionManager zkClient has connected
[junit4] 2> 122335 INFO
(TEST-MultiThreadedOCPTest.test-seed#[DEE62991148E9A5B]) [ ]
o.a.s.c.c.ConnectionManager Client is connected to ZooKeeper
[junit4] 2> 122439 INFO
(TEST-MultiThreadedOCPTest.test-seed#[DEE62991148E9A5B]) [n:127.0.0.1:64485_
] o.a.s.c.c.ConnectionManager Waiting for client to connect to ZooKeeper
[junit4] 2> 122444 INFO (zkConnectionManagerCallback-1481-thread-1) [
] o.a.s.c.c.ConnectionManager zkClient has connected
[junit4] 2> 122444 INFO
(TEST-MultiThreadedOCPTest.test-seed#[DEE62991148E9A5B]) [n:127.0.0.1:64485_
] o.a.s.c.c.ConnectionManager Client is connected to ZooKeeper
[junit4] 2> 122927 INFO
(TEST-MultiThreadedOCPTest.test-seed#[DEE62991148E9A5B]) [n:127.0.0.1:64485_
] o.a.s.c.OverseerElectionContext I am going to be the leader 127.0.0.1:64485_
[junit4] 2> 122931 INFO
(TEST-MultiThreadedOCPTest.test-seed#[DEE62991148E9A5B]) [n:127.0.0.1:64485_
] o.a.s.c.Overseer Overseer
(id=72066357524430852-127.0.0.1:64485_-n_0000000000) starting
[junit4] 2> 122951 INFO
(TEST-MultiThreadedOCPTest.test-seed#[DEE62991148E9A5B]) [n:127.0.0.1:64485_
] o.a.s.c.ZkController Register node as live in
ZooKeeper:/live_nodes/127.0.0.1:64485_
[junit4] 2> 122951 INFO
(OverseerStateUpdate-72066357524430852-127.0.0.1:64485_-n_0000000000)
[n:127.0.0.1:64485_ ] o.a.s.c.Overseer Starting to work on the main queue :
127.0.0.1:64485_
[junit4] 2> 122955 INFO
(OverseerStateUpdate-72066357524430852-127.0.0.1:64485_-n_0000000000)
[n:127.0.0.1:64485_ ] o.a.s.c.c.ZkStateReader Updated live nodes from
ZooKeeper... (0) -> (1)
[junit4] 2> 122961 INFO
(TEST-MultiThreadedOCPTest.test-seed#[DEE62991148E9A5B]) [n:127.0.0.1:64485_
] o.a.s.p.PackageLoader /packages.json updated to version -1
[junit4] 2> 122962 WARN
(TEST-MultiThreadedOCPTest.test-seed#[DEE62991148E9A5B]) [n:127.0.0.1:64485_
] o.a.s.c.CoreContainer Not all security plugins configured!
authentication=disabled authorization=disabled. Solr is only as secure as you
make it. Consider configuring authentication/authorization before exposing Solr
to users internal or external. See https://s.apache.org/solrsecurity for more
info
[junit4] 2> 122975 INFO
(TEST-MultiThreadedOCPTest.test-seed#[DEE62991148E9A5B]) [n:127.0.0.1:64485_
] o.a.s.h.a.MetricsHistoryHandler No .system collection, keeping metrics
history in memory.
[junit4] 2> 123002 INFO
(TEST-MultiThreadedOCPTest.test-seed#[DEE62991148E9A5B]) [n:127.0.0.1:64485_
] o.a.s.m.r.SolrJmxReporter JMX monitoring for 'solr.node' (registry
'solr.node') enabled at server: com.sun.jmx.mbeanserver.JmxMBeanServer@308db165
[junit4] 2> 123012 INFO
(TEST-MultiThreadedOCPTest.test-seed#[DEE62991148E9A5B]) [n:127.0.0.1:64485_
] o.a.s.m.r.SolrJmxReporter JMX monitoring for 'solr.jvm' (registry
'solr.jvm') enabled at server: com.sun.jmx.mbeanserver.JmxMBeanServer@308db165
[junit4] 2> 123012 INFO
(TEST-MultiThreadedOCPTest.test-seed#[DEE62991148E9A5B]) [n:127.0.0.1:64485_
] o.a.s.m.r.SolrJmxReporter JMX monitoring for 'solr.jetty' (registry
'solr.jetty') enabled at server: com.sun.jmx.mbeanserver.JmxMBeanServer@308db165
[junit4] 2> 123013 INFO
(TEST-MultiThreadedOCPTest.test-seed#[DEE62991148E9A5B]) [n:127.0.0.1:64485_
] o.a.s.c.CorePropertiesLocator Found 0 core definitions underneath
C:\Users\jenkins\workspace\Lucene-Solr-8.x-Windows\solr\build\solr-core\test\J1\temp\solr.cloud.MultiThreadedOCPTest_DEE62991148E9A5B-001\control-001\cores
[junit4] 2> 123032 INFO
(TEST-MultiThreadedOCPTest.test-seed#[DEE62991148E9A5B]) [ ]
o.a.s.c.c.ConnectionManager Waiting for client to connect to ZooKeeper
[junit4] 2> 123035 INFO (zkConnectionManagerCallback-1498-thread-1) [
] o.a.s.c.c.ConnectionManager zkClient has connected
[junit4] 2> 123037 INFO
(TEST-MultiThreadedOCPTest.test-seed#[DEE62991148E9A5B]) [ ]
o.a.s.c.c.ConnectionManager Client is connected to ZooKeeper
[junit4] 2> 123037 INFO
(TEST-MultiThreadedOCPTest.test-seed#[DEE62991148E9A5B]) [ ]
o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (0) -> (1)
[junit4] 2> 123040 INFO
(TEST-MultiThreadedOCPTest.test-seed#[DEE62991148E9A5B]) [ ]
o.a.s.c.s.i.ZkClientClusterStateProvider Cluster at 127.0.0.1:64469/solr ready
[junit4] 2> 123044 INFO (qtp596628061-2139) [n:127.0.0.1:64485_ ]
o.a.s.h.a.CollectionsHandler Invoked Collection Action :create with params
collection.configName=conf1&name=control_collection&nrtReplicas=1&action=CREATE&numShards=1&createNodeSet=127.0.0.1:64485_&wt=javabin&version=2
and sendToOCPQueue=true
[junit4] 2> 123051 INFO
(OverseerThreadFactory-1488-thread-1-processing-n:127.0.0.1:64485_)
[n:127.0.0.1:64485_ ] o.a.s.c.a.c.CreateCollectionCmd Create collection
control_collection
[junit4] 2> 123174 INFO (qtp596628061-2138) [n:127.0.0.1:64485_
x:control_collection_shard1_replica_n1 ] o.a.s.h.a.CoreAdminOperation core
create command
qt=/admin/cores&collection.configName=conf1&newCollection=true&name=control_collection_shard1_replica_n1&action=CREATE&numShards=1&collection=control_collection&shard=shard1&wt=javabin&version=2&replicaType=NRT
[junit4] 2> 123174 INFO (qtp596628061-2138) [n:127.0.0.1:64485_
x:control_collection_shard1_replica_n1 ] o.a.s.c.TransientSolrCoreCacheDefault
Allocating transient cache for 4 transient cores
[junit4] 2> 124207 INFO (qtp596628061-2138) [n:127.0.0.1:64485_
c:control_collection s:shard1 x:control_collection_shard1_replica_n1 ]
o.a.s.c.SolrConfig Using Lucene MatchVersion: 8.7.0
[junit4] 2> 124225 INFO (qtp596628061-2138) [n:127.0.0.1:64485_
c:control_collection s:shard1 x:control_collection_shard1_replica_n1 ]
o.a.s.s.IndexSchema Schema name=test
[junit4] 2> 124263 WARN (qtp596628061-2138) [n:127.0.0.1:64485_
c:control_collection s:shard1 x:control_collection_shard1_replica_n1 ]
o.a.s.D.s.WordDelimiterFilterFactory Solr loaded a deprecated plugin/analysis
class [solr.WordDelimiterFilterFactory]. Please consult documentation how to
replace it accordingly.
[junit4] 2> 124303 WARN (qtp596628061-2138) [n:127.0.0.1:64485_
c:control_collection s:shard1 x:control_collection_shard1_replica_n1 ]
o.a.s.D.s.GeoHashField Solr loaded a deprecated plugin/analysis class
[solr.GeoHashField]. Please consult documentation how to replace it accordingly.
[junit4] 2> 124307 WARN (qtp596628061-2138) [n:127.0.0.1:64485_
c:control_collection s:shard1 x:control_collection_shard1_replica_n1 ]
o.a.s.D.s.LatLonType Solr loaded a deprecated plugin/analysis class
[solr.LatLonType]. Please consult documentation how to replace it accordingly.
[junit4] 2> 124315 WARN (qtp596628061-2138) [n:127.0.0.1:64485_
c:control_collection s:shard1 x:control_collection_shard1_replica_n1 ]
o.a.s.D.s.CurrencyField Solr loaded a deprecated plugin/analysis class
[solr.CurrencyField]. Please consult documentation how to replace it
accordingly.
[junit4] 2> 124549 INFO (qtp596628061-2138) [n:127.0.0.1:64485_
c:control_collection s:shard1 x:control_collection_shard1_replica_n1 ]
o.a.s.s.IndexSchema Loaded schema test/1.0 with uniqueid field id
[junit4] 2> 124783 INFO (qtp596628061-2138) [n:127.0.0.1:64485_
c:control_collection s:shard1 x:control_collection_shard1_replica_n1 ]
o.a.s.c.CoreContainer Creating SolrCore 'control_collection_shard1_replica_n1'
using configuration from configset conf1, trusted=true
[junit4] 2> 124784 INFO (qtp596628061-2138) [n:127.0.0.1:64485_
c:control_collection s:shard1 x:control_collection_shard1_replica_n1 ]
o.a.s.m.r.SolrJmxReporter JMX monitoring for
'solr.core.control_collection.shard1.replica_n1' (registry
'solr.core.control_collection.shard1.replica_n1') enabled at server:
com.sun.jmx.mbeanserver.JmxMBeanServer@308db165
[junit4] 2> 124784 INFO (qtp596628061-2138) [n:127.0.0.1:64485_
c:control_collection s:shard1 x:control_collection_shard1_replica_n1 ]
o.a.s.c.SolrCore [[control_collection_shard1_replica_n1] ] Opening new SolrCore
at
[C:\Users\jenkins\workspace\Lucene-Solr-8.x-Windows\solr\build\solr-core\test\J1\temp\solr.cloud.MultiThreadedOCPTest_DEE62991148E9A5B-001\control-001\cores\control_collection_shard1_replica_n1],
dataDir=[C:\Users\jenkins\workspace\Lucene-Solr-8.x-Windows\solr\build\solr-core\test\J1\temp\solr.cloud.MultiThreadedOCPTest_DEE62991148E9A5B-001\control-001\cores\control_collection_shard1_replica_n1\data\]
[junit4] 2> 124807 INFO (qtp596628061-2138) [n:127.0.0.1:64485_
c:control_collection s:shard1 x:control_collection_shard1_replica_n1 ]
o.a.s.u.RandomMergePolicy RandomMergePolicy wrapping class
org.apache.lucene.index.LogByteSizeMergePolicy: [LogByteSizeMergePolicy:
minMergeSize=1677721, mergeFactor=14, maxMergeSize=2147483648,
maxMergeSizeForForcedMerge=9223372036854775807, calibrateSizeByDeletes=true,
maxMergeDocs=2147483647, maxCFSSegmentSizeMB=8.796093022207999E12,
noCFSRatio=0.44967713750038885]
[junit4] 2> 124855 WARN (qtp596628061-2138) [n:127.0.0.1:64485_
c:control_collection s:shard1 x:control_collection_shard1_replica_n1 ]
o.a.s.c.RequestHandlers INVALID paramSet a in requestHandler {type =
requestHandler,name = /dump,class = DumpRequestHandler,attributes =
{initParams=a, name=/dump, class=DumpRequestHandler},args =
{defaults={a=A,b=B}}}
[junit4] 2> 124963 INFO (qtp596628061-2138) [n:127.0.0.1:64485_
c:control_collection s:shard1 x:control_collection_shard1_replica_n1 ]
o.a.s.u.UpdateHandler Using UpdateLog implementation:
org.apache.solr.update.UpdateLog
[junit4] 2> 124963 INFO (qtp596628061-2138) [n:127.0.0.1:64485_
c:control_collection s:shard1 x:control_collection_shard1_replica_n1 ]
o.a.s.u.UpdateLog Initializing UpdateLog: dataDir= defaultSyncLevel=FLUSH
numRecordsToKeep=100 maxNumLogsToKeep=10 numVersionBuckets=65536
[junit4] 2> 124965 INFO (qtp596628061-2138) [n:127.0.0.1:64485_
c:control_collection s:shard1 x:control_collection_shard1_replica_n1 ]
o.a.s.u.CommitTracker Hard AutoCommit: disabled
[junit4] 2> 124965 INFO (qtp596628061-2138) [n:127.0.0.1:64485_
c:control_collection s:shard1 x:control_collection_shard1_replica_n1 ]
o.a.s.u.CommitTracker Soft AutoCommit: disabled
[junit4] 2> 124967 INFO (qtp596628061-2138) [n:127.0.0.1:64485_
c:control_collection s:shard1 x:control_collection_shard1_replica_n1 ]
o.a.s.u.RandomMergePolicy RandomMergePolicy wrapping class
org.apache.lucene.index.LogDocMergePolicy: [LogDocMergePolicy:
minMergeSize=1000, mergeFactor=32, maxMergeSize=9223372036854775807,
maxMergeSizeForForcedMerge=9223372036854775807, calibrateSizeByDeletes=false,
maxMergeDocs=2147483647, maxCFSSegmentSizeMB=8.796093022207999E12,
noCFSRatio=0.0]
[junit4] 2> 124976 INFO (qtp596628061-2138) [n:127.0.0.1:64485_
c:control_collection s:shard1 x:control_collection_shard1_replica_n1 ]
o.a.s.r.ManagedResourceStorage Configured ZooKeeperStorageIO with znodeBase:
/configs/conf1
[junit4] 2> 124983 INFO (qtp596628061-2138) [n:127.0.0.1:64485_
c:control_collection s:shard1 x:control_collection_shard1_replica_n1 ]
o.a.s.r.ManagedResourceStorage Loaded null at path _rest_managed.json using
ZooKeeperStorageIO:path=/configs/conf1
[junit4] 2> 124984 INFO (qtp596628061-2138) [n:127.0.0.1:64485_
c:control_collection s:shard1 x:control_collection_shard1_replica_n1 ]
o.a.s.h.ReplicationHandler Commits will be reserved for 10000 ms
[junit4] 2> 124985 INFO (qtp596628061-2138) [n:127.0.0.1:64485_
c:control_collection s:shard1 x:control_collection_shard1_replica_n1 ]
o.a.s.u.UpdateLog Could not find max version in index or recent updates, using
new clock 1679670378930110464
[junit4] 2> 124991 INFO
(searcherExecutor-1500-thread-1-processing-n:127.0.0.1:64485_
x:control_collection_shard1_replica_n1 c:control_collection s:shard1)
[n:127.0.0.1:64485_ c:control_collection s:shard1
x:control_collection_shard1_replica_n1 ] o.a.s.c.SolrCore
[control_collection_shard1_replica_n1] Registered new searcher autowarm time:
0 ms
[junit4] 2> 125034 INFO (qtp596628061-2138) [n:127.0.0.1:64485_
c:control_collection s:shard1 x:control_collection_shard1_replica_n1 ]
o.a.s.c.ZkShardTerms Successful update of terms at
/collections/control_collection/terms/shard1 to Terms{values={core_node2=0},
version=0}
[junit4] 2> 125034 INFO (qtp596628061-2138) [n:127.0.0.1:64485_
c:control_collection s:shard1 x:control_collection_shard1_replica_n1 ]
o.a.s.c.ShardLeaderElectionContextBase make sure parent is created
/collections/control_collection/leaders/shard1
[junit4] 2> 125197 INFO (qtp596628061-2138) [n:127.0.0.1:64485_
c:control_collection s:shard1 x:control_collection_shard1_replica_n1 ]
o.a.s.c.ShardLeaderElectionContext Enough replicas found to continue.
[junit4] 2> 125197 INFO (qtp596628061-2138) [n:127.0.0.1:64485_
c:control_collection s:shard1 x:control_collection_shard1_replica_n1 ]
o.a.s.c.ShardLeaderElectionContext I may be the new leader - try and sync
[junit4] 2> 125197 INFO (qtp596628061-2138) [n:127.0.0.1:64485_
c:control_collection s:shard1 x:control_collection_shard1_replica_n1 ]
o.a.s.c.SyncStrategy Sync replicas to
http://127.0.0.1:64485/control_collection_shard1_replica_n1/
[junit4] 2> 125199 INFO (qtp596628061-2138) [n:127.0.0.1:64485_
c:control_collection s:shard1 x:control_collection_shard1_replica_n1 ]
o.a.s.c.SyncStrategy Sync Success - now sync replicas to me
[junit4] 2> 125200 INFO (qtp596628061-2138) [n:127.0.0.1:64485_
c:control_collection s:shard1 x:control_collection_shard1_replica_n1 ]
o.a.s.c.SyncStrategy
http://127.0.0.1:64485/control_collection_shard1_replica_n1/ has no replicas
[junit4] 2> 125200 INFO (qtp596628061-2138) [n:127.0.0.1:64485_
c:control_collection s:shard1 x:control_collection_shard1_replica_n1 ]
o.a.s.c.ShardLeaderElectionContextBase Creating leader registration node
/collections/control_collection/leaders/shard1/leader after winning as
/collections/control_collection/leader_elect/shard1/election/72066357524430852-core_node2-n_0000000000
[junit4] 2> 125272 INFO (qtp596628061-2138) [n:127.0.0.1:64485_
c:control_collection s:shard1 x:control_collection_shard1_replica_n1 ]
o.a.s.c.ShardLeaderElectionContext I am the new leader:
http://127.0.0.1:64485/control_collection_shard1_replica_n1/ shard1
[junit4] 2> 125440 INFO (zkCallback-1480-thread-1) [ ]
o.a.s.c.c.ZkStateReader A cluster state change: [WatchedEvent
state:SyncConnected type:NodeDataChanged
path:/collections/control_collection/state.json] for collection
[control_collection] has occurred - updating... (live nodes size: [1])
[junit4] 2> 125495 INFO (zkCallback-1480-thread-2) [ ]
o.a.s.c.c.ZkStateReader A cluster state change: [WatchedEvent
state:SyncConnected type:NodeDataChanged
path:/collections/control_collection/state.json] for collection
[control_collection] has occurred - updating... (live nodes size: [1])
[junit4] 2> 125500 INFO (qtp596628061-2138) [n:127.0.0.1:64485_
c:control_collection s:shard1 x:control_collection_shard1_replica_n1 ]
o.a.s.c.ZkController I am the leader, no recovery necessary
[junit4] 2> 125587 INFO (qtp596628061-2138) [n:127.0.0.1:64485_ ]
o.a.s.s.HttpSolrCall [admin] webapp=null path=/admin/cores
params={qt=/admin/cores&collection.configName=conf1&newCollection=true&name=control_collection_shard1_replica_n1&action=CREATE&numShards=1&collection=control_collection&shard=shard1&wt=javabin&version=2&replicaType=NRT}
status=0 QTime=2414
[junit4] 2> 125686 INFO (qtp596628061-2139) [n:127.0.0.1:64485_ ]
o.a.s.h.a.CollectionsHandler Wait for new collection to be active for at most
45 seconds. Check all shard replicas
[junit4] 2> 125718 INFO (zkCallback-1480-thread-2) [ ]
o.a.s.c.c.ZkStateReader A cluster state change: [WatchedEvent
state:SyncConnected type:NodeDataChanged
path:/collections/control_collection/state.json] for collection
[control_collection] has occurred - updating... (live nodes size: [1])
[junit4] 2> 125718 INFO (zkCallback-1480-thread-1) [ ]
o.a.s.c.c.ZkStateReader A cluster state change: [WatchedEvent
state:SyncConnected type:NodeDataChanged
path:/collections/control_collection/state.json] for collection
[control_collection] has occurred - updating... (live nodes size: [1])
[junit4] 2> 125718 INFO (zkCallback-1480-thread-3) [ ]
o.a.s.c.c.ZkStateReader A cluster state change: [WatchedEvent
state:SyncConnected type:NodeDataChanged
path:/collections/control_collection/state.json] for collection
[control_collection] has occurred - updating... (live nodes size: [1])
[junit4] 2> 125733 INFO (qtp596628061-2139) [n:127.0.0.1:64485_ ]
o.a.s.s.HttpSolrCall [admin] webapp=null path=/admin/collections
params={collection.configName=conf1&name=control_collection&nrtReplicas=1&action=CREATE&numShards=1&createNodeSet=127.0.0.1:64485_&wt=javabin&version=2}
status=0 QTime=2693
[junit4] 2> 125737 INFO
(TEST-MultiThreadedOCPTest.test-seed#[DEE62991148E9A5B]) [ ]
o.a.s.c.AbstractFullDistribZkTestBase Waiting to see 1 active replicas in
collection: control_collection
[junit4] 2> 125910 INFO
(TEST-MultiThreadedOCPTest.test-seed#[DEE62991148E9A5B]) [ ]
o.a.s.c.c.ConnectionManager Waiting for client to connect to ZooKeeper
[junit4] 2> 125965 INFO (zkConnectionManagerCallback-1509-thread-1) [
] o.a.s.c.c.ConnectionManager zkClient has connected
[junit4] 2> 125965 INFO
(TEST-MultiThreadedOCPTest.test-seed#[DEE62991148E9A5B]) [ ]
o.a.s.c.c.ConnectionManager Client is connected to ZooKeeper
[junit4] 2> 125968 INFO
(TEST-MultiThreadedOCPTest.test-seed#[DEE62991148E9A5B]) [ ]
o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (0) -> (1)
[junit4] 2> 125977 INFO
(TEST-MultiThreadedOCPTest.test-seed#[DEE62991148E9A5B]) [ ]
o.a.s.c.s.i.ZkClientClusterStateProvider Cluster at 127.0.0.1:64469/solr ready
[junit4] 2> 125977 INFO
(TEST-MultiThreadedOCPTest.test-seed#[DEE62991148E9A5B]) [ ]
o.a.s.c.ChaosMonkey monkey: init - expire sessions:false cause connection
loss:false
[junit4] 2> 125981 INFO (qtp596628061-2139) [n:127.0.0.1:64485_ ]
o.a.s.h.a.CollectionsHandler Invoked Collection Action :create with params
collection.configName=conf1&name=collection1&nrtReplicas=1&action=CREATE&numShards=2&createNodeSet=&stateFormat=1&wt=javabin&version=2
and sendToOCPQueue=true
[junit4] 2> 126011 INFO
(OverseerCollectionConfigSetProcessor-72066357524430852-127.0.0.1:64485_-n_0000000000)
[n:127.0.0.1:64485_ ] o.a.s.c.OverseerTaskQueue Response ZK path:
/overseer/collection-queue-work/qnr-0000000000 doesn't exist. Requestor may
have disconnected from ZooKeeper
[junit4] 2> 126026 INFO
(OverseerThreadFactory-1488-thread-2-processing-n:127.0.0.1:64485_)
[n:127.0.0.1:64485_ ] o.a.s.c.a.c.CreateCollectionCmd Create collection
collection1
[junit4] 2> 126252 WARN
(OverseerThreadFactory-1488-thread-2-processing-n:127.0.0.1:64485_)
[n:127.0.0.1:64485_ ] o.a.s.c.a.c.CreateCollectionCmd It is unusual to
create a collection (collection1) without cores.
[junit4] 2> 126265 INFO (qtp596628061-2139) [n:127.0.0.1:64485_ ]
o.a.s.h.a.CollectionsHandler Wait for new collection to be active for at most
45 seconds. Check all shard replicas
[junit4] 2> 126266 INFO (qtp596628061-2139) [n:127.0.0.1:64485_ ]
o.a.s.s.HttpSolrCall [admin] webapp=null path=/admin/collections
params={collection.configName=conf1&name=collection1&nrtReplicas=1&action=CREATE&numShards=2&createNodeSet=&stateFormat=1&wt=javabin&version=2}
status=0 QTime=285
[junit4] 2> 126269 INFO
(TEST-MultiThreadedOCPTest.test-seed#[DEE62991148E9A5B]) [ ]
o.a.s.c.SolrCloudTestCase active slice count: 2 expected: 2
[junit4] 2> 126269 INFO
(TEST-MultiThreadedOCPTest.test-seed#[DEE62991148E9A5B]) [ ]
o.a.s.c.SolrCloudTestCase active replica count: 0 expected replica count: 0
[junit4] 2> 126269 INFO
(TEST-MultiThreadedOCPTest.test-seed#[DEE62991148E9A5B]) [ ]
o.a.s.c.SolrCloudTestCase active slice count: 2 expected: 2
[junit4] 2> 126269 INFO
(TEST-MultiThreadedOCPTest.test-seed#[DEE62991148E9A5B]) [ ]
o.a.s.c.SolrCloudTestCase active replica count: 0 expected replica count: 0
[junit4] 2> 126269 INFO
(TEST-MultiThreadedOCPTest.test-seed#[DEE62991148E9A5B]) [ ]
o.a.s.c.SolrCloudTestCase active slice count: 2 expected: 2
[junit4] 2> 126269 INFO
(TEST-MultiThreadedOCPTest.test-seed#[DEE62991148E9A5B]) [ ]
o.a.s.c.SolrCloudTestCase active replica count: 0 expected replica count: 0
[junit4] 2> 126269 INFO
(TEST-MultiThreadedOCPTest.test-seed#[DEE62991148E9A5B]) [ ]
o.a.s.c.AbstractFullDistribZkTestBase Creating jetty instances
pullReplicaCount=0 numOtherReplicas=3
[junit4] 2> 126864 INFO
(TEST-MultiThreadedOCPTest.test-seed#[DEE62991148E9A5B]) [ ]
o.a.s.c.AbstractFullDistribZkTestBase create jetty 1 in directory
C:\Users\jenkins\workspace\Lucene-Solr-8.x-Windows\solr\build\solr-core\test\J1\temp\solr.cloud.MultiThreadedOCPTest_DEE62991148E9A5B-001\shard-1-001
of type NRT for shard2
[junit4] 2> 126866 WARN (closeThreadPool-1510-thread-1) [ ]
o.e.j.s.h.g.GzipHandler minGzipSize of 0 is inefficient for short content,
break even is size 23
[junit4] 2> 126867 INFO (closeThreadPool-1510-thread-1) [ ]
o.a.s.c.s.e.JettySolrRunner Start Jetty (configured port=0, binding port=0)
[junit4] 2> 126867 INFO (closeThreadPool-1510-thread-1) [ ]
o.a.s.c.s.e.JettySolrRunner Trying to start Jetty on port 0 try number 2 ...
[junit4] 2> 126867 INFO (closeThreadPool-1510-thread-1) [ ]
o.e.j.s.Server jetty-9.4.27.v20200227; built: 2020-02-27T18:37:21.340Z; git:
a304fd9f351f337e7c0e2a7c28878dd536149c6c; jvm 13.0.2+8
[junit4] 2> 126868 INFO (closeThreadPool-1510-thread-1) [ ]
o.e.j.s.session DefaultSessionIdManager workerName=node0
[junit4] 2> 126868 INFO (closeThreadPool-1510-thread-1) [ ]
o.e.j.s.session No SessionScavenger set, using defaults
[junit4] 2> 126868 INFO (closeThreadPool-1510-thread-1) [ ]
o.e.j.s.session node0 Scavenging every 600000ms
[junit4] 2> 126868 INFO (closeThreadPool-1510-thread-1) [ ]
o.e.j.s.h.ContextHandler Started
o.e.j.s.ServletContextHandler@1f9d87fd{/,null,AVAILABLE}
[junit4] 2> 126871 INFO (closeThreadPool-1510-thread-1) [ ]
o.e.j.s.AbstractConnector Started ServerConnector@f914160{HTTP/1.1, (http/1.1,
h2c)}{127.0.0.1:64666}
[junit4] 2> 126871 INFO (closeThreadPool-1510-thread-1) [ ]
o.e.j.s.Server Started @126921ms
[junit4] 2> 126871 INFO (closeThreadPool-1510-thread-1) [ ]
o.a.s.c.s.e.JettySolrRunner Jetty properties: {hostContext=/,
solrconfig=solrconfig.xml,
solr.data.dir=C:\Users\jenkins\workspace\Lucene-Solr-8.x-Windows\solr\build\solr-core\test\J1\temp\solr.cloud.MultiThreadedOCPTest_DEE62991148E9A5B-001\tempDir-001/jetty1,
hostPort=64666,
coreRootDirectory=C:\Users\jenkins\workspace\Lucene-Solr-8.x-Windows\solr\build\solr-core\test\J1\..\..\..\..\..\..\..\..\..\Users\jenkins\workspace\Lucene-Solr-8.x-Windows\solr\build\solr-core\test\J1\temp\solr.cloud.MultiThreadedOCPTest_DEE62991148E9A5B-001\shard-1-001\cores,
replicaType=NRT}
[junit4] 2> 126872 ERROR (closeThreadPool-1510-thread-1) [ ]
o.a.s.u.StartupLoggingUtils Missing Java Option solr.log.dir. Logging may be
missing or incomplete.
[junit4] 2> 126872 INFO (closeThreadPool-1510-thread-1) [ ]
o.a.s.s.SolrDispatchFilter Using logger factory
org.apache.logging.slf4j.Log4jLoggerFactory
[junit4] 2> 126872 INFO (closeThreadPool-1510-thread-1) [ ]
o.a.s.s.SolrDispatchFilter ___ _ Welcome to Apache Solr? version
8.7.0
[junit4] 2> 126872 INFO (closeThreadPool-1510-thread-1) [ ]
o.a.s.s.SolrDispatchFilter / __| ___| |_ _ Starting in cloud mode on port null
[junit4] 2> 126872 INFO (closeThreadPool-1510-thread-1) [ ]
o.a.s.s.SolrDispatchFilter \__ \/ _ \ | '_| Install dir:
C:\Users\jenkins\workspace\Lucene-Solr-8.x-Windows\solr
[junit4] 2> 126872 INFO (closeThreadPool-1510-thread-1) [ ]
o.a.s.s.SolrDispatchFilter |___/\___/_|_| Start time:
2020-10-05T00:41:42.301081600Z
[junit4] 2> 126873 INFO (closeThreadPool-1510-thread-1) [ ]
o.a.s.c.c.ConnectionManager Waiting for client to connect to ZooKeeper
[junit4] 2> 126875 INFO (zkConnectionManagerCallback-1512-thread-1) [
] o.a.s.c.c.ConnectionManager zkClient has connected
[junit4] 2> 126875 INFO (closeThreadPool-1510-thread-1) [ ]
o.a.s.c.c.ConnectionManager Client is connected to ZooKeeper
[junit4] 2> 126983 INFO (closeThreadPool-1510-thread-1) [ ]
o.a.s.s.SolrDispatchFilter Loading solr.xml from SolrHome (not found in
ZooKeeper)
[junit4] 2> 126983 INFO (closeThreadPool-1510-thread-1) [ ]
o.a.s.c.SolrXmlConfig Loading container configuration from
C:\Users\jenkins\workspace\Lucene-Solr-8.x-Windows\solr\build\solr-core\test\J1\..\..\..\..\..\..\..\..\..\Users\jenkins\workspace\Lucene-Solr-8.x-Windows\solr\build\solr-core\test\J1\temp\solr.cloud.MultiThreadedOCPTest_DEE62991148E9A5B-001\shard-1-001\solr.xml
[junit4] 2> 126987 INFO (closeThreadPool-1510-thread-1) [ ]
o.a.s.c.SolrXmlConfig Configuration parameter autoReplicaFailoverWorkLoopDelay
is ignored
[junit4] 2> 126987 INFO (closeThreadPool-1510-thread-1) [ ]
o.a.s.c.SolrXmlConfig Configuration parameter
autoReplicaFailoverBadNodeExpiration is ignored
[junit4] 2> 126987 INFO (closeThreadPool-1510-thread-1) [ ]
o.a.s.c.SolrXmlConfig MBean server found:
com.sun.jmx.mbeanserver.JmxMBeanServer@308db165, but no JMX reporters were
configured - adding default JMX reporter.
[junit4] 2> 127103 INFO (closeThreadPool-1510-thread-1) [ ]
o.a.s.h.c.HttpShardHandlerFactory Host whitelist initialized:
WhitelistHostChecker [whitelistHosts=null, whitelistHostCheckingEnabled=false]
[junit4] 2> 127104 WARN (closeThreadPool-1510-thread-1) [ ]
o.e.j.u.s.S.config Trusting all certificates configured for
Client@5e9ea7a3[provider=null,keyStore=null,trustStore=null]
[junit4] 2> 127104 WARN (closeThreadPool-1510-thread-1) [ ]
o.e.j.u.s.S.config No Client EndPointIdentificationAlgorithm configured for
Client@5e9ea7a3[provider=null,keyStore=null,trustStore=null]
[junit4] 2> 127109 WARN (closeThreadPool-1510-thread-1) [ ]
o.e.j.u.s.S.config Trusting all certificates configured for
Client@29c90469[provider=null,keyStore=null,trustStore=null]
[junit4] 2> 127109 WARN (closeThreadPool-1510-thread-1) [ ]
o.e.j.u.s.S.config No Client EndPointIdentificationAlgorithm configured for
Client@29c90469[provider=null,keyStore=null,trustStore=null]
[junit4] 2> 127109 INFO (closeThreadPool-1510-thread-1) [ ]
o.a.s.c.ZkContainer Zookeeper client=127.0.0.1:64469/solr
[junit4] 2> 127112 INFO (closeThreadPool-1510-thread-1) [ ]
o.a.s.c.c.ConnectionManager Waiting for client to connect to ZooKeeper
[junit4] 2> 127116 INFO (zkConnectionManagerCallback-1522-thread-1) [
] o.a.s.c.c.ConnectionManager zkClient has connected
[junit4] 2> 127117 INFO (closeThreadPool-1510-thread-1) [ ]
o.a.s.c.c.ConnectionManager Client is connected to ZooKeeper
[junit4] 2> 127222 INFO (closeThreadPool-1510-thread-1)
[n:127.0.0.1:64666_ ] o.a.s.c.c.ConnectionManager Waiting for client to
connect to ZooKeeper
[junit4] 2> 127226 INFO (zkConnectionManagerCallback-1524-thread-1) [
] o.a.s.c.c.ConnectionManager zkClient has connected
[junit4] 2> 127226 INFO (closeThreadPool-1510-thread-1)
[n:127.0.0.1:64666_ ] o.a.s.c.c.ConnectionManager Client is connected to
ZooKeeper
[junit4] 2> 127233 INFO (closeThreadPool-1510-thread-1)
[n:127.0.0.1:64666_ ] o.a.s.c.c.ZkStateReader Updated live nodes from
ZooKeeper... (0) -> (1)
[junit4] 2> 127242 INFO (closeThreadPool-1510-thread-1)
[n:127.0.0.1:64666_ ] o.a.s.c.ZkController Publish node=127.0.0.1:64666_ as
DOWN
[junit4] 2> 127245 INFO (closeThreadPool-1510-thread-1)
[n:127.0.0.1:64666_ ] o.a.s.c.TransientSolrCoreCacheDefault Allocating
transient cache for 4 transient cores
[junit4] 2> 127245 INFO (closeThreadPool-1510-thread-1)
[n:127.0.0.1:64666_ ] o.a.s.c.ZkController Register node as live in
ZooKeeper:/live_nodes/127.0.0.1:64666_
[junit4] 2> 127249 INFO (zkCallback-1480-thread-4) [ ]
o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (1) -> (2)
[junit4] 2> 127250 INFO (zkCallback-1508-thread-1) [ ]
o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (1) -> (2)
[junit4] 2> 127256 INFO (zkCallback-1523-thread-1) [ ]
o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (1) -> (2)
[junit4] 2> 127258 INFO (closeThreadPool-1510-thread-1)
[n:127.0.0.1:64666_ ] o.a.s.p.PackageLoader /packages.json updated to
version -1
[junit4] 2> 127259 WARN (closeThreadPool-1510-thread-1)
[n:127.0.0.1:64666_ ] o.a.s.c.CoreContainer Not all security plugins
configured! authentication=disabled authorization=disabled. Solr is only as
secure as you make it. Consider configuring authentication/authorization before
exposing Solr to users internal or external. See
https://s.apache.org/solrsecurity for more info
[junit4] 2> 127277 INFO (closeThreadPool-1510-thread-1)
[n:127.0.0.1:64666_ ] o.a.s.h.a.MetricsHistoryHandler No .system
collection, keeping metrics history in memory.
[junit4] 2> 127306 INFO (closeThreadPool-1510-thread-1)
[n:127.0.0.1:64666_ ] o.a.s.m.r.SolrJmxReporter JMX monitoring for
'solr.node' (registry 'solr.node') enabled at server:
com.sun.jmx.mbeanserver.JmxMBeanServer@308db165
[junit4] 2> 127323 INFO (closeThreadPool-1510-thread-1)
[n:127.0.0.1:64666_ ] o.a.s.m.r.SolrJmxReporter JMX monitoring for
'solr.jvm' (registry 'solr.jvm') enabled at server:
com.sun.jmx.mbeanserver.JmxMBeanServer@308db165
[junit4] 2> 127323 INFO (closeThreadPool-1510-thread-1)
[n:127.0.0.1:64666_ ] o.a.s.m.r.SolrJmxReporter JMX monitoring for
'solr.jetty' (registry 'solr.jetty') enabled at server:
com.sun.jmx.mbeanserver.JmxMBeanServer@308db165
[junit4] 2> 127325 INFO (closeThreadPool-1510-thread-1)
[n:127.0.0.1:64666_ ] o.a.s.c.CorePropertiesLocator Found 0 core
definitions underneath
C:\Users\jenkins\workspace\Lucene-Solr-8.x-Windows\solr\build\solr-core\test\J1\temp\solr.cloud.MultiThreadedOCPTest_DEE62991148E9A5B-001\shard-1-001\cores
[junit4] 2> 127342 INFO (closeThreadPool-1510-thread-1) [ ]
o.a.s.c.AbstractFullDistribZkTestBase waitForLiveNode: 127.0.0.1:64666_
[junit4] 2> 127492 INFO
(TEST-MultiThreadedOCPTest.test-seed#[DEE62991148E9A5B]) [ ]
o.a.s.c.AbstractFullDistribZkTestBase create jetty 2 in directory
C:\Users\jenkins\workspace\Lucene-Solr-8.x-Windows\solr\build\solr-core\test\J1\temp\solr.cloud.MultiThreadedOCPTest_DEE62991148E9A5B-001\shard-2-001
of type NRT for shard1
[junit4] 2> 127492 WARN (closeThreadPool-1510-thread-1) [ ]
o.e.j.s.h.g.GzipHandler minGzipSize of 0 is inefficient for short content,
break even is size 23
[junit4] 2> 127492 INFO (closeThreadPool-1510-thread-1) [ ]
o.a.s.c.s.e.JettySolrRunner Start Jetty (configured port=0, binding port=0)
[junit4] 2> 127492 INFO (closeThreadPool-1510-thread-1) [ ]
o.a.s.c.s.e.JettySolrRunner Trying to start Jetty on port 0 try number 2 ...
[junit4] 2> 127492 INFO (closeThreadPool-1510-thread-1) [ ]
o.e.j.s.Server jetty-9.4.27.v20200227; built: 2020-02-27T18:37:21.340Z; git:
a304fd9f351f337e7c0e2a7c28878dd536149c6c; jvm 13.0.2+8
[junit4] 2> 127494 INFO (closeThreadPool-1510-thread-1) [ ]
o.e.j.s.session DefaultSessionIdManager workerName=node0
[junit4] 2> 127494 INFO (closeThreadPool-1510-thread-1) [ ]
o.e.j.s.session No SessionScavenger set, using defaults
[junit4] 2> 127494 INFO (closeThreadPool-1510-thread-1) [ ]
o.e.j.s.session node0 Scavenging every 600000ms
[junit4] 2> 127494 INFO (closeThreadPool-1510-thread-1) [ ]
o.e.j.s.h.ContextHandler Started
o.e.j.s.ServletContextHandler@23cf2723{/,null,AVAILABLE}
[junit4] 2> 127494 INFO (closeThreadPool-1510-thread-1) [ ]
o.e.j.s.AbstractConnector Started ServerConnector@2a8b354a{HTTP/1.1, (http/1.1,
h2c)}{127.0.0.1:64696}
[junit4] 2> 127494 INFO (closeThreadPool-1510-thread-1) [ ]
o.e.j.s.Server Started @127546ms
[junit4] 2> 127494 INFO (closeThreadPool-1510-thread-1) [ ]
o.a.s.c.s.e.JettySolrRunner Jetty properties: {hostContext=/,
solrconfig=solrconfig.xml,
solr.data.dir=C:\Users\jenkins\workspace\Lucene-Solr-8.x-Windows\solr\build\solr-core\test\J1\temp\solr.cloud.MultiThreadedOCPTest_DEE62991148E9A5B-001\tempDir-001/jetty2,
hostPort=64696,
coreRootDirectory=C:\Users\jenkins\workspace\Lucene-Solr-8.x-Windows\solr\build\solr-core\test\J1\..\..\..\..\..\..\..\..\..\Users\jenkins\workspace\Lucene-Solr-8.x-Windows\solr\build\solr-core\test\J1\temp\solr.cloud.MultiThreadedOCPTest_DEE62991148E9A5B-001\shard-2-001\cores,
replicaType=NRT}
[junit4] 2> 127497 ERROR (closeThreadPool-1510-thread-1) [ ]
o.a.s.u.StartupLoggingUtils Missing Java Option solr.log.dir. Logging may be
missing or incomplete.
[junit4] 2> 127497 INFO (closeThreadPool-1510-thread-1) [ ]
o.a.s.s.SolrDispatchFilter Using logger factory
org.apache.logging.slf4j.Log4jLoggerFactory
[junit4] 2> 127497 INFO (closeThreadPool-1510-thread-1) [ ]
o.a.s.s.SolrDispatchFilter ___ _ Welcome to Apache Solr? version
8.7.0
[junit4] 2> 127497 INFO (closeThreadPool-1510-thread-1) [ ]
o.a.s.s.SolrDispatchFilter / __| ___| |_ _ Starting in cloud mode on port null
[junit4] 2> 127497 INFO (closeThreadPool-1510-thread-1) [ ]
o.a.s.s.SolrDispatchFilter \__ \/ _ \ | '_| Install dir:
C:\Users\jenkins\workspace\Lucene-Solr-8.x-Windows\solr
[junit4] 2> 127497 INFO (closeThreadPool-1510-thread-1) [ ]
o.a.s.s.SolrDispatchFilter |___/\___/_|_| Start time:
2020-10-05T00:41:42.926478900Z
[junit4] 2> 127498 INFO (closeThreadPool-1510-thread-1) [ ]
o.a.s.c.c.ConnectionManager Waiting for client to connect to ZooKeeper
[junit4] 2> 127503 INFO (zkConnectionManagerCallback-1534-thread-1) [
] o.a.s.c.c.ConnectionManager zkClient has connected
[junit4] 2> 127503 INFO (closeThreadPool-1510-thread-1) [ ]
o.a.s.c.c.ConnectionManager Client is connected to ZooKeeper
[junit4] 2> 127606 INFO (closeThreadPool-1510-thread-1) [ ]
o.a.s.s.SolrDispatchFilter Loading solr.xml from SolrHome (not found in
ZooKeeper)
[junit4] 2> 127606 INFO (closeThreadPool-1510-thread-1) [ ]
o.a.s.c.SolrXmlConfig Loading container configuration from
C:\Users\jenkins\workspace\Lucene-Solr-8.x-Windows\solr\build\solr-core\test\J1\..\..\..\..\..\..\..\..\..\Users\jenkins\workspace\Lucene-Solr-8.x-Windows\solr\build\solr-core\test\J1\temp\solr.cloud.MultiThreadedOCPTest_DEE62991148E9A5B-001\shard-2-001\solr.xml
[junit4] 2> 127610 INFO (closeThreadPool-1510-thread-1) [ ]
o.a.s.c.SolrXmlConfig Configuration parameter autoReplicaFailoverWorkLoopDelay
is ignored
[junit4] 2> 127610 INFO (closeThreadPool-1510-thread-1) [ ]
o.a.s.c.SolrXmlConfig Configuration parameter
autoReplicaFailoverBadNodeExpiration is ignored
[junit4] 2> 127610 INFO (closeThreadPool-1510-thread-1) [ ]
o.a.s.c.SolrXmlConfig MBean server found:
com.sun.jmx.mbeanserver.JmxMBeanServer@308db165, but no JMX reporters were
configured - adding default JMX reporter.
[junit4] 2> 127898 INFO (closeThreadPool-1510-thread-1) [ ]
o.a.s.h.c.HttpShardHandlerFactory Host whitelist initialized:
WhitelistHostChecker [whitelistHosts=null, whitelistHostCheckingEnabled=false]
[junit4] 2> 127901 WARN (closeThreadPool-1510-thread-1) [ ]
o.e.j.u.s.S.config Trusting all certificates configured for
Client@79bc6754[provider=null,keyStore=null,trustStore=null]
[junit4] 2> 127901 WARN (closeThreadPool-1510-thread-1) [ ]
o.e.j.u.s.S.config No Client EndPointIdentificationAlgorithm configured for
Client@79bc6754[provider=null,keyStore=null,trustStore=null]
[junit4] 2> 127905 WARN (closeThreadPool-1510-thread-1) [ ]
o.e.j.u.s.S.config Trusting all certificates configured for
Client@79833a89[provider=null,keyStore=null,trustStore=null]
[junit4] 2> 127905 WARN (closeThreadPool-1510-thread-1) [ ]
o.e.j.u.s.S.config No Client EndPointIdentificationAlgorithm configured for
Client@79833a89[provider=null,keyStore=null,trustStore=null]
[junit4] 2> 127906 INFO (closeThreadPool-1510-thread-1) [ ]
o.a.s.c.ZkContainer Zookeeper client=127.0.0.1:64469/solr
[junit4] 2> 127907 INFO (closeThreadPool-1510-thread-1) [ ]
o.a.s.c.c.ConnectionManager Waiting for client to connect to ZooKeeper
[junit4] 2> 127911 INFO (zkConnectionManagerCallback-1544-thread-1) [
] o.a.s.c.c.ConnectionManager zkClient has connected
[junit4] 2> 127911 INFO (closeThreadPool-1510-thread-1) [ ]
o.a.s.c.c.ConnectionManager Client is connected to ZooKeeper
[junit4] 2> 128017 INFO (closeThreadPool-1510-thread-1)
[n:127.0.0.1:64696_ ] o.a.s.c.c.ConnectionManager Waiting for client to
connect to ZooKeeper
[junit4] 2> 128021 INFO (zkConnectionManagerCallback-1546-thread-1) [
] o.a.s.c.c.ConnectionManager zkClient has connected
[junit4] 2> 128021 INFO (closeThreadPool-1510-thread-1)
[n:127.0.0.1:64696_ ] o.a.s.c.c.ConnectionManager Client is connected to
ZooKeeper
[junit4] 2> 128026 INFO
(OverseerCollectionConfigSetProcessor-72066357524430852-127.0.0.1:64485_-n_0000000000)
[n:127.0.0.1:64485_ ] o.a.s.c.OverseerTaskQueue Response ZK path:
/overseer/collection-queue-work/qnr-0000000002 doesn't exist. Requestor may
have disconnected from ZooKeeper
[junit4] 2> 128032 INFO (closeThreadPool-1510-thread-1)
[n:127.0.0.1:64696_ ] o.a.s.c.c.ZkStateReader Updated live nodes from
ZooKeeper... (0) -> (2)
[junit4] 2> 128042 INFO (closeThreadPool-1510-thread-1)
[n:127.0.0.1:64696_ ] o.a.s.c.ZkController Publish node=127.0.0.1:64696_ as
DOWN
[junit4] 2> 128045 INFO (closeThreadPool-1510-thread-1)
[n:127.0.0.1:64696_ ] o.a.s.c.TransientSolrCoreCacheDefault Allocating
transient cache for 4 transient cores
[junit4] 2> 128047 INFO (closeThreadPool-1510-thread-1)
[n:127.0.0.1:64696_ ] o.a.s.c.ZkController Register node as live in
ZooKeeper:/live_nodes/127.0.0.1:64696_
[junit4] 2> 128052 INFO (zkCallback-1480-thread-4) [ ]
o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (2) -> (3)
[junit4] 2> 128052 INFO (zkCallback-1508-thread-1) [ ]
o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (2) -> (3)
[junit4] 2> 128052 INFO (zkCallback-1523-thread-1) [ ]
o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (2) -> (3)
[junit4] 2> 128054 INFO (zkCallback-1545-thread-1) [ ]
o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (2) -> (3)
[junit4] 2> 128056 INFO (closeThreadPool-1510-thread-1)
[n:127.0.0.1:64696_ ] o.a.s.p.PackageLoader /packages.json updated to
version -1
[junit4] 2> 128056 WARN (closeThreadPool-1510-thread-1)
[n:127.0.0.1:64696_ ] o.a.s.c.CoreContainer Not all security plugins
configured! authentication=disabled authorization=disabled. Solr is only as
secure as you make it. Consider configuring authentication/authorization before
exposing Solr to users internal or external. See
https://s.apache.org/solrsecurity for more info
[junit4] 2> 128085 INFO (closeThreadPool-1510-thread-1)
[n:127.0.0.1:64696_ ] o.a.s.h.a.MetricsHistoryHandler No .system
collection, keeping metrics history in memory.
[junit4] 2> 128105 INFO (closeThreadPool-1510-thread-1)
[n:127.0.0.1:64696_ ] o.a.s.m.r.SolrJmxReporter JMX monitoring for
'solr.node' (registry 'solr.node') enabled at server:
com.sun.jmx.mbeanserver.JmxMBeanServer@308db165
[junit4] 2> 128111 INFO (closeThreadPool-1510-thread-1)
[n:127.0.0.1:64696_ ] o.a.s.m.r.SolrJmxReporter JMX monitoring for
'solr.jvm' (registry 'solr.jvm') enabled at server:
com.sun.jmx.mbeanserver.JmxMBeanServer@308db165
[junit4] 2> 128111 INFO (closeThreadPool-1510-thread-1)
[n:127.0.0.1:64696_ ] o.a.s.m.r.SolrJmxReporter JMX monitoring for
'solr.jetty' (registry 'solr.jetty') enabled at server:
com.sun.jmx.mbeanserver.JmxMBeanServer@308db165
[junit4] 2> 128112 INFO (closeThreadPool-1510-thread-1)
[n:127.0.0.1:64696_ ] o.a.s.c.CorePropertiesLocator Found 0 core
definitions underneath
C:\Users\jenkins\workspace\Lucene-Solr-8.x-Windows\solr\build\solr-core\test\J1\temp\solr.cloud.MultiThreadedOCPTest_DEE62991148E9A5B-001\shard-2-001\cores
[junit4] 2> 128127 INFO (closeThreadPool-1510-thread-1) [ ]
o.a.s.c.AbstractFullDistribZkTestBase waitForLiveNode: 127.0.0.1:64696_
[junit4] 2> 128139 INFO
(TEST-MultiThreadedOCPTest.test-seed#[DEE62991148E9A5B]) [ ]
o.a.s.c.AbstractFullDistribZkTestBase create jetty 3 in directory
C:\Users\jenkins\workspace\Lucene-Solr-8.x-Windows\solr\build\solr-core\test\J1\temp\solr.cloud.MultiThreadedOCPTest_DEE62991148E9A5B-001\shard-3-001
of type NRT for shard2
[junit4] 2> 128139 WARN (closeThreadPool-1510-thread-1) [ ]
o.e.j.s.h.g.GzipHandler minGzipSize of 0 is inefficient for short content,
break even is size 23
[junit4] 2> 128139 INFO (closeThreadPool-1510-thread-1) [ ]
o.a.s.c.s.e.JettySolrRunner Start Jetty (configured port=0, binding port=0)
[junit4] 2> 128139 INFO (closeThreadPool-1510-thread-1) [ ]
o.a.s.c.s.e.JettySolrRunner Trying to start Jetty on port 0 try number 2 ...
[junit4] 2> 128139 INFO (closeThreadPool-1510-thread-1) [ ]
o.e.j.s.Server jetty-9.4.27.v20200227; built: 2020-02-27T18:37:21.340Z; git:
a304fd9f351f337e7c0e2a7c28878dd536149c6c; jvm 13.0.2+8
[junit4] 2> 128139 INFO (closeThreadPool-1510-thread-1) [ ]
o.e.j.s.session DefaultSessionIdManager workerName=node0
[junit4] 2> 128139 INFO (closeThreadPool-1510-thread-1) [ ]
o.e.j.s.session No SessionScavenger set, using defaults
[junit4] 2> 128139 INFO (closeThreadPool-1510-thread-1) [ ]
o.e.j.s.session node0 Scavenging every 660000ms
[junit4] 2> 128139 INFO (closeThreadPool-1510-thread-1) [ ]
o.e.j.s.h.ContextHandler Started
o.e.j.s.ServletContextHandler@5eb78abb{/,null,AVAILABLE}
[junit4] 2> 128144 INFO (closeThreadPool-1510-thread-1) [ ]
o.e.j.s.AbstractConnector Started ServerConnector@66f0d18b{HTTP/1.1, (http/1.1,
h2c)}{127.0.0.1:64736}
[junit4] 2> 128144 INFO (closeThreadPool-1510-thread-1) [ ]
o.e.j.s.Server Started @128195ms
[junit4] 2> 128144 INFO (closeThreadPool-1510-thread-1) [ ]
o.a.s.c.s.e.JettySolrRunner Jetty properties: {hostContext=/,
solrconfig=solrconfig.xml,
solr.data.dir=C:\Users\jenkins\workspace\Lucene-Solr-8.x-Windows\solr\build\solr-core\test\J1\temp\solr.cloud.MultiThreadedOCPTest_DEE62991148E9A5B-001\tempDir-001/jetty3,
hostPort=64736,
coreRootDirectory=C:\Users\jenkins\workspace\Lucene-Solr-8.x-Windows\solr\build\solr-core\test\J1\temp\solr.cloud.MultiThreadedOCPTest_DEE62991148E9A5B-001\shard-3-001\cores,
replicaType=NRT}
[junit4] 2> 128144 ERROR (closeThreadPool-1510-thread-1) [ ]
o.a.s.u.StartupLoggingUtils Missing Java Option solr.log.dir. Logging may be
missing or incomplete.
[junit4] 2> 128144 INFO (closeThreadPool-1510-thread-1) [ ]
o.a.s.s.SolrDispatchFilter Using logger factory
org.apache.logging.slf4j.Log4jLoggerFactory
[junit4] 2> 128144 INFO (closeThreadPool-1510-thread-1) [ ]
o.a.s.s.SolrDispatchFilter ___ _ Welcome to Apache Solr? version
8.7.0
[junit4] 2> 128144 INFO (closeThreadPool-1510-thread-1) [ ]
o.a.s.s.SolrDispatchFilter / __| ___| |_ _ Starting in cloud mode on port null
[junit4] 2> 128144 INFO (closeThreadPool-1510-thread-1) [ ]
o.a.s.s.SolrDispatchFilter \__ \/ _ \ | '_| Install dir:
C:\Users\jenkins\workspace\Lucene-Solr-8.x-Windows\solr
[junit4] 2> 128144 INFO (closeThreadPool-1510-thread-1) [ ]
o.a.s.s.SolrDispatchFilter |___/\___/_|_| Start time:
2020-10-05T00:41:43.573336200Z
[junit4] 2> 128144 INFO (closeThreadPool-1510-thread-1) [ ]
o.a.s.c.c.ConnectionManager Waiting for client to connect to ZooKeeper
[junit4] 2> 128147 INFO (zkConnectionManagerCallback-1556-thread-1) [
] o.a.s.c.c.ConnectionManager zkClient has connected
[junit4] 2> 128147 INFO (closeThreadPool-1510-thread-1) [ ]
o.a.s.c.c.ConnectionManager Client is connected to ZooKeeper
[junit4] 2> 128254 INFO (closeThreadPool-1510-thread-1) [ ]
o.a.s.s.SolrDispatchFilter Loading solr.xml from SolrHome (not found in
ZooKeeper)
[junit4] 2> 128254 INFO (closeThreadPool-1510-thread-1) [ ]
o.a.s.c.SolrXmlConfig Loading container configuration from
C:\Users\jenkins\workspace\Lucene-Solr-8.x-Windows\solr\build\solr-core\test\J1\temp\solr.cloud.MultiThreadedOCPTest_DEE62991148E9A5B-001\shard-3-001\solr.xml
[junit4] 2> 128258 INFO (closeThreadPool-1510-thread-1) [ ]
o.a.s.c.SolrXmlConfig Configuration parameter autoReplicaFailoverWorkLoopDelay
is ignored
[junit4] 2> 128258 INFO (closeThreadPool-1510-thread-1) [ ]
o.a.s.c.SolrXmlConfig Configuration parameter
autoReplicaFailoverBadNodeExpiration is ignored
[junit4] 2> 128259 INFO (closeThreadPool-1510-thread-1) [ ]
o.a.s.c.SolrXmlConfig MBean server found:
com.sun.jmx.mbeanserver.JmxMBeanServer@308db165, but no JMX reporters were
configured - adding default JMX reporter.
[junit4] 2> 128373 INFO (closeThreadPool-1510-thread-1) [ ]
o.a.s.h.c.HttpShardHandlerFactory Host whitelist initialized:
WhitelistHostChecker [whitelistHosts=null, whitelistHostCheckingEnabled=false]
[junit4] 2> 128374 WARN (closeThreadPool-1510-thread-1) [ ]
o.e.j.u.s.S.config Trusting all certificates configured for
Client@235161c8[provider=null,keyStore=null,trustStore=null]
[junit4] 2> 128375 WARN (closeThreadPool-1510-thread-1) [ ]
o.e.j.u.s.S.config No Client EndPointIdentificationAlgorithm configured for
Client@235161c8[provider=null,keyStore=null,trustStore=null]
[junit4] 2> 128379 WARN (closeThreadPool-1510-thread-1) [ ]
o.e.j.u.s.S.config Trusting all certificates configured for
Client@46b7ccfd[provider=null,keyStore=null,trustStore=null]
[junit4] 2> 128379 WARN (closeThreadPool-1510-thread-1) [ ]
o.e.j.u.s.S.config No Client EndPointIdentificationAlgorithm configured for
Client@46b7ccfd[provider=null,keyStore=null,trustStore=null]
[junit4] 2> 128379 INFO (closeThreadPool-1510-thread-1) [ ]
o.a.s.c.ZkContainer Zookeeper client=127.0.0.1:64469/solr
[junit4] 2> 128381 INFO (closeThreadPool-1510-thread-1) [ ]
o.a.s.c.c.ConnectionManager Waiting for client to connect to ZooKeeper
[junit4] 2> 128385 INFO (zkConnectionManagerCallback-1566-thread-1) [
] o.a.s.c.c.ConnectionManager zkClient has connected
[junit4] 2> 128386 INFO (closeThreadPool-1510-thread-1) [ ]
o.a.s.c.c.ConnectionManager Client is connected to ZooKeeper
[junit4] 2> 128389 WARN
(closeThreadPool-1510-thread-1-SendThread(127.0.0.1:64469)) [ ]
o.a.z.ClientCnxn An exception was thrown while closing send thread for session
0x10007f86880000e.
[junit4] 2> => EndOfStreamException: Unable to read additional
data from server sessionid 0x10007f86880000e, likely server has closed socket
[junit4] 2> at
org.apache.zookeeper.ClientCnxnSocketNIO.doIO(ClientCnxnSocketNIO.java:77)
[junit4] 2> org.apache.zookeeper.ClientCnxn$EndOfStreamException: Unable
to read additional data from server sessionid 0x10007f86880000e, likely server
has closed socket
[junit4] 2> at
org.apache.zookeeper.ClientCnxnSocketNIO.doIO(ClientCnxnSocketNIO.java:77)
~[zookeeper-3.6.2.jar:3.6.2]
[junit4] 2> at
org.apache.zookeeper.ClientCnxnSocketNIO.doTransport(ClientCnxnSocketNIO.java:350)
~[zookeeper-3.6.2.jar:3.6.2]
[junit4] 2> at
org.apache.zookeeper.ClientCnxn$SendThread.run(ClientCnxn.java:1275)
[zookeeper-3.6.2.jar:3.6.2]
[junit4] 2> 128491 INFO (closeThreadPool-1510-thread-1)
[n:127.0.0.1:64736_ ] o.a.s.c.c.ConnectionManager Waiting for client to
connect to ZooKeeper
[junit4] 2> 128495 INFO (zkConnectionManagerCallback-1568-thread-1) [
] o.a.s.c.c.ConnectionManager zkClient has connected
[junit4] 2> 128495 INFO (closeThreadPool-1510-thread-1)
[n:127.0.0.1:64736_ ] o.a.s.c.c.ConnectionManager Client is connected to
ZooKeeper
[junit4] 2> 128502 INFO (closeThreadPool-1510-thread-1)
[n:127.0.0.1:64736_ ] o.a.s.c.c.ZkStateReader Updated live nodes from
ZooKeeper... (0) -> (3)
[junit4] 2> 128509 INFO (closeThreadPool-1510-thread-1)
[n:127.0.0.1:64736_ ] o.a.s.c.ZkController Publish node=127.0.0.1:64736_ as
DOWN
[junit4] 2> 128512 INFO (closeThreadPool-1510-thread-1)
[n:127.0.0.1:64736_ ] o.a.s.c.TransientSolrCoreCacheDefault Allocating
transient cache for 4 transient cores
[junit4] 2> 128512 INFO (closeThreadPool-1510-thread-1)
[n:127.0.0.1:64736_ ] o.a.s.c.ZkController Register node as live in
ZooKeeper:/live_nodes/127.0.0.1:64736_
[junit4] 2> 128516 INFO (zkCallback-1508-thread-1) [ ]
o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (3) -> (4)
[junit4] 2> 128516 INFO (zkCallback-1480-thread-4) [ ]
o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (3) -> (4)
[junit4] 2> 128516 INFO (zkCallback-1523-thread-1) [ ]
o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (3) -> (4)
[junit4] 2> 128516 INFO (zkCallback-1545-thread-1) [ ]
o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (3) -> (4)
[junit4] 2> 128516 INFO (zkCallback-1567-thread-1) [ ]
o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (3) -> (4)
[junit4] 2> 128516 INFO (closeThreadPool-1510-thread-1)
[n:127.0.0.1:64736_ ] o.a.s.p.PackageLoader /packages.json updated to
version -1
[junit4] 2> 128519 WARN (closeThreadPool-1510-thread-1)
[n:127.0.0.1:64736_ ] o.a.s.c.CoreContainer Not all security plugins
configured! authentication=disabled authorization=disabled. Solr is only as
secure as you make it. Consider configuring authentication/authorization before
exposing Solr to users internal or external. See
https://s.apache.org/solrsecurity for more info
[junit4] 2> 128537 INFO (closeThreadPool-1510-thread-1)
[n:127.0.0.1:64736_ ] o.a.s.h.a.MetricsHistoryHandler No .system
collection, keeping metrics history in memory.
[junit4] 2> 128560 INFO (closeThreadPool-1510-thread-1)
[n:127.0.0.1:64736_ ] o.a.s.m.r.SolrJmxReporter JMX monitoring for
'solr.node' (registry 'solr.node') enabled at server:
com.sun.jmx.mbeanserver.JmxMBeanServer@308db165
[junit4] 2> 128567 INFO (closeThreadPool-1510-thread-1)
[n:127.0.0.1:64736_ ] o.a.s.m.r.SolrJmxReporter JMX monitoring for
'solr.jvm' (registry 'solr.jvm') enabled at server:
com.sun.jmx.mbeanserver.JmxMBeanServer@308db165
[junit4] 2> 128567 INFO (closeThreadPool-1510-thread-1)
[n:127.0.0.1:64736_ ] o.a.s.m.r.SolrJmxReporter JMX monitoring for
'solr.jetty' (registry 'solr.jetty') enabled at server:
com.sun.jmx.mbeanserver.JmxMBeanServer@308db165
[junit4] 2> 128567 INFO (closeThreadPool-1510-thread-1)
[n:127.0.0.1:64736_ ] o.a.s.c.CorePropertiesLocator Found 0 core
definitions underneath
C:\Users\jenkins\workspace\Lucene-Solr-8.x-Windows\solr\build\solr-core\test\J1\temp\solr.cloud.MultiThreadedOCPTest_DEE62991148E9A5B-001\shard-3-001\cores
[junit4] 2> 128584 INFO (closeThreadPool-1510-thread-1) [ ]
o.a.s.c.AbstractFullDistribZkTestBase waitForLiveNode: 127.0.0.1:64736_
[junit4] 2> 128589 INFO (qtp596628061-2141) [n:127.0.0.1:64485_ ]
o.a.s.h.a.CollectionsHandler Invoked Collection Action :addreplica with params
node=127.0.0.1:64736_&action=ADDREPLICA&collection=collection1&shard=shard2&type=NRT&wt=javabin&version=2
and sendToOCPQueue=true
[junit4] 2> 128589 INFO (qtp596628061-2139) [n:127.0.0.1:64485_ ]
o.a.s.h.a.CollectionsHandler Invoked Collection Action :addreplica with params
node=127.0.0.1:64696_&action=ADDREPLICA&collection=collection1&shard=shard1&type=NRT&wt=javabin&version=2
and sendToOCPQueue=true
[junit4] 2> 128589 INFO (qtp596628061-2140) [n:127.0.0.1:64485_ ]
o.a.s.h.a.CollectionsHandler Invoked Collection Action :addreplica with params
node=127.0.0.1:64666_&action=ADDREPLICA&collection=collection1&shard=shard2&type=NRT&wt=javabin&version=2
and sendToOCPQueue=true
[junit4] 2> 128598 INFO
(OverseerThreadFactory-1488-thread-3-processing-n:127.0.0.1:64485_)
[n:127.0.0.1:64485_ c:collection1 s:shard2 ] o.a.s.c.a.c.AddReplicaCmd Node
Identified 127.0.0.1:64736_ for creating new replica of shard shard2 for
collection collection1
[junit4] 2> 128598 INFO
(OverseerThreadFactory-1488-thread-4-processing-n:127.0.0.1:64485_)
[n:127.0.0.1:64485_ c:collection1 s:shard1 ] o.a.s.c.a.c.AddReplicaCmd Node
Identified 127.0.0.1:64696_ for creating new replica of shard shard1 for
collection collection1
[junit4] 2> 128604 INFO
(OverseerThreadFactory-1488-thread-3-processing-n:127.0.0.1:64485_)
[n:127.0.0.1:64485_ c:collection1 s:shard2 ] o.a.s.c.a.c.AddReplicaCmd
Returning CreateReplica command.
[junit4] 2> 128608 INFO
(OverseerThreadFactory-1488-thread-4-processing-n:127.0.0.1:64485_)
[n:127.0.0.1:64485_ c:collection1 s:shard1 ] o.a.s.c.a.c.AddReplicaCmd
Returning CreateReplica command.
[junit4] 2> 128608 INFO (qtp83972460-2258) [n:127.0.0.1:64736_
x:collection1_shard2_replica_n1 ] o.a.s.h.a.CoreAdminOperation core create
command
qt=/admin/cores&collection.configName=conf1&name=collection1_shard2_replica_n1&action=CREATE&collection=collection1&shard=shard2&wt=javabin&version=2&replicaType=NRT
[junit4] 2> 128612 INFO (qtp1041122635-2228) [n:127.0.0.1:64696_
x:collection1_shard1_replica_n2 ] o.a.s.h.a.CoreAdminOperation core create
command
qt=/admin/cores&collection.configName=conf1&name=collection1_shard1_replica_n2&action=CREATE&collection=collection1&shard=shard1&wt=javabin&version=2&replicaType=NRT
[junit4] 2> 129669 INFO (qtp83972460-2258) [n:127.0.0.1:64736_
c:collection1 s:shard2 x:collection1_shard2_replica_n1 ] o.a.s.c.SolrConfig
Using Lucene MatchVersion: 8.7.0
[junit4] 2> 129669 INFO (qtp1041122635-2228) [n:127.0.0.1:64696_
c:collection1 s:shard1 x:collection1_shard1_replica_n2 ] o.a.s.c.SolrConfig
Using Lucene MatchVersion: 8.7.0
[junit4] 2> 129709 INFO (qtp1041122635-2228) [n:127.0.0.1:64696_
c:collection1 s:shard1 x:collection1_shard1_replica_n2 ] o.a.s.s.IndexSchema
Schema name=test
[junit4] 2> 129742 INFO (qtp83972460-2258) [n:127.0.0.1:64736_
c:collection1 s:shard2 x:collection1_shard2_replica_n1 ] o.a.s.s.IndexSchema
Schema name=test
[junit4] 2> 130051 INFO (qtp83972460-2258) [n:127.0.0.1:64736_
c:collection1 s:shard2 x:collection1_shard2_replica_n1 ] o.a.s.s.IndexSchema
Loaded schema test/1.0 with uniqueid field id
[junit4] 2> 130069 INFO (qtp1041122635-2228) [n:127.0.0.1:64696_
c:collection1 s:shard1 x:collection1_shard1_replica_n2 ] o.a.s.s.IndexSchema
Loaded schema test/1.0 with uniqueid field id
[junit4] 2> 130364 INFO (qtp83972460-2258) [n:127.0.0.1:64736_
c:collection1 s:shard2 x:collection1_shard2_replica_n1 ] o.a.s.c.CoreContainer
Creating SolrCore 'collection1_shard2_replica_n1' using configuration from
configset conf1, trusted=true
[junit4] 2> 130364 INFO (qtp83972460-2258) [n:127.0.0.1:64736_
c:collection1 s:shard2 x:collection1_shard2_replica_n1 ]
o.a.s.m.r.SolrJmxReporter JMX monitoring for
'solr.core.collection1.shard2.replica_n1' (registry
'solr.core.collection1.shard2.replica_n1') enabled at server:
com.sun.jmx.mbeanserver.JmxMBeanServer@308db165
[junit4] 2> 130364 INFO (qtp83972460-2258) [n:127.0.0.1:64736_
c:collection1 s:shard2 x:collection1_shard2_replica_n1 ] o.a.s.c.SolrCore
[[collection1_shard2_replica_n1] ] Opening new SolrCore at
[C:\Users\jenkins\workspace\Lucene-Solr-8.x-Windows\solr\build\solr-core\test\J1\temp\solr.cloud.MultiThreadedOCPTest_DEE62991148E9A5B-001\shard-3-001\cores\collection1_shard2_replica_n1],
dataDir=[C:\Users\jenkins\workspace\Lucene-Solr-8.x-Windows\solr\build\solr-core\test\J1\temp\solr.cloud.MultiThreadedOCPTest_DEE62991148E9A5B-001\shard-3-001\cores\collection1_shard2_replica_n1\data\]
[junit4] 2> 130371 INFO (qtp83972460-2258) [n:127.0.0.1:64736_
c:collection1 s:shard2 x:collection1_shard2_replica_n1 ]
o.a.s.u.RandomMergePolicy RandomMergePolicy wrapping class
org.apache.lucene.index.LogByteSizeMergePolicy: [LogByteSizeMergePolicy:
minMergeSize=1677721, mergeFactor=14, maxMergeSize=2147483648,
maxMergeSizeForForcedMerge=9223372036854775807, calibrateSizeByDeletes=true,
maxMergeDocs=2147483647, maxCFSSegmentSizeMB=8.796093022207999E12,
noCFSRatio=0.44967713750038885]
[junit4] 2> 130375 WARN (qtp83972460-2258) [n:127.0.0.1:64736_
c:collection1 s:shard2 x:collection1_shard2_replica_n1 ]
o.a.s.c.RequestHandlers INVALID paramSet a in requestHandler {type =
requestHandler,name = /dump,class = DumpRequestHandler,attributes =
{initParams=a, name=/dump, class=DumpRequestHandler},args =
{defaults={a=A,b=B}}}
[junit4] 2> 130379 INFO (qtp1041122635-2228) [n:127.0.0.1:64696_
c:collection1 s:shard1 x:collection1_shard1_replica_n2 ] o.a.s.c.CoreContainer
Creating SolrCore 'collection1_shard1_replica_n2' using configuration from
configset conf1, trusted=true
[junit4] 2> 130381 INFO (qtp1041122635-2228) [n:127.0.0.1:64696_
c:collection1 s:shard1 x:collection1_shard1_replica_n2 ]
o.a.s.m.r.SolrJmxReporter JMX monitoring for
'solr.core.collection1.shard1.replica_n2' (registry
'solr.core.collection1.shard1.replica_n2') enabled at server:
com.sun.jmx.mbeanserver.JmxMBeanServer@308db165
[junit4] 2> 130381 INFO (qtp1041122635-2228) [n:127.0.0.1:64696_
c:collection1 s:shard1 x:collection1_shard1_replica_n2 ] o.a.s.c.SolrCore
[[collection1_shard1_replica_n2] ] Opening new SolrCore at
[C:\Users\jenkins\workspace\Lucene-Solr-8.x-Windows\solr\build\solr-core\test\J1\temp\solr.cloud.MultiThreadedOCPTest_DEE62991148E9A5B-001\shard-2-001\cores\collection1_shard1_replica_n2],
dataDir=[C:\Users\jenkins\workspace\Lucene-Solr-8.x-Windows\solr\build\solr-core\test\J1\temp\solr.cloud.MultiThreadedOCPTest_DEE62991148E9A5B-001\shard-2-001\cores\collection1_shard1_replica_n2\data\]
[junit4] 2> 130392 INFO (qtp1041122635-2228) [n:127.0.0.1:64696_
c:collection1 s:shard1 x:collection1_shard1_replica_n2 ]
o.a.s.u.RandomMergePolicy RandomMergePolicy wrapping class
org.apache.lucene.index.LogByteSizeMergePolicy: [LogByteSizeMergePolicy:
minMergeSize=1677721, mergeFactor=14, maxMergeSize=2147483648,
maxMergeSizeForForcedMerge=9223372036854775807, calibrateSizeByDeletes=true,
maxMergeDocs=2147483647, maxCFSSegmentSizeMB=8.796093022207999E12,
noCFSRatio=0.44967713750038885]
[junit4] 2> 130397 WARN (qtp1041122635-2228) [n:127.0.0.1:64696_
c:collection1 s:shard1 x:collection1_shard1_replica_n2 ]
o.a.s.c.RequestHandlers INVALID paramSet a in requestHandler {type =
requestHandler,name = /dump,class = DumpRequestHandler,attributes =
{initParams=a, name=/dump, class=DumpRequestHandler},args =
{defaults={a=A,b=B}}}
[junit4] 2> 130555 INFO (qtp83972460-2258) [n:127.0.0.1:64736_
c:collection1 s:shard2 x:collection1_shard2_replica_n1 ] o.a.s.u.UpdateHandler
Using UpdateLog implementation: org.apache.solr.update.UpdateLog
[junit4] 2> 130555 INFO (qtp83972460-2258) [n:127.0.0.1:64736_
c:collection1 s:shard2 x:collection1_shard2_replica_n1 ] o.a.s.u.UpdateLog
Initializing UpdateLog: dataDir= defaultSyncLevel=FLUSH numRecordsToKeep=100
maxNumLogsToKeep=10 numVersionBuckets=65536
[junit4] 2> 130563 INFO (qtp83972460-2258) [n:127.0.0.1:64736_
c:collection1 s:shard2 x:collection1_shard2_replica_n1 ] o.a.s.u.CommitTracker
Hard AutoCommit: disabled
[junit4] 2> 130563 INFO (qtp83972460-2258) [n:127.0.0.1:64736_
c:collection1 s:shard2 x:collection1_shard2_replica_n1 ] o.a.s.u.CommitTracker
Soft AutoCommit: disabled
[junit4] 2> 130566 INFO (qtp83972460-2258) [n:127.0.0.1:64736_
c:collection1 s:shard2 x:collection1_shard2_replica_n1 ]
o.a.s.u.RandomMergePolicy RandomMergePolicy wrapping class
org.apache.lucene.index.LogDocMergePolicy: [LogDocMergePolicy:
minMergeSize=1000, mergeFactor=32, maxMergeSize=9223372036854775807,
maxMergeSizeForForcedMerge=9223372036854775807, calibrateSizeByDeletes=false,
maxMergeDocs=2147483647, maxCFSSegmentSizeMB=8.796093022207999E12,
noCFSRatio=0.0]
[junit4] 2> 130579 INFO (qtp83972460-2258) [n:127.0.0.1:64736_
c:collection1 s:shard2 x:collection1_shard2_replica_n1 ]
o.a.s.r.ManagedResourceStorage Configured ZooKeeperStorageIO with znodeBase:
/configs/conf1
[junit4] 2> 130585 INFO (qtp83972460-2258) [n:127.0.0.1:64736_
c:collection1 s:shard2 x:collection1_shard2_replica_n1 ]
o.a.s.r.ManagedResourceStorage Loaded null at path _rest_managed.json using
ZooKeeperStorageIO:path=/configs/conf1
[junit4] 2> 130585 INFO (qtp83972460-2258) [n:127.0.0.1:64736_
c:collection1 s:shard2 x:collection1_shard2_replica_n1 ]
o.a.s.h.ReplicationHandler Commits will be reserved for 10000 ms
[junit4] 2> 130585 INFO (qtp83972460-2258) [n:127.0.0.1:64736_
c:collection1 s:shard2 x:collection1_shard2_replica_n1 ] o.a.s.u.UpdateLog
Could not find max version in index or recent updates, using new clock
1679670384802136064
[junit4] 2> 130595 INFO (qtp1041122635-2228) [n:127.0.0.1:64696_
c:collection1 s:shard1 x:collection1_shard1_replica_n2 ] o.a.s.u.UpdateHandler
Using UpdateLog implementation: org.apache.solr.update.UpdateLog
[junit4] 2> 130595 INFO (qtp1041122635-2228) [n:127.0.0.1:64696_
c:collection1 s:shard1 x:collection1_shard1_replica_n2 ] o.a.s.u.UpdateLog
Initializing UpdateLog: dataDir= defaultSyncLevel=FLUSH numRecordsToKeep=100
maxNumLogsToKeep=10 numVersionBuckets=65536
[junit4] 2> 130603 INFO (qtp1041122635-2228) [n:127.0.0.1:64696_
c:collection1 s:shard1 x:collection1_shard1_replica_n2 ] o.a.s.u.CommitTracker
Hard AutoCommit: disabled
[junit4] 2> 130603 INFO (qtp1041122635-2228) [n:127.0.0.1:64696_
c:collection1 s:shard1 x:collection1_shard1_replica_n2 ] o.a.s.u.CommitTracker
Soft AutoCommit: disabled
[junit4] 2> 130607 INFO (qtp1041122635-2228) [n:127.0.0.1:64696_
c:collection1 s:shard1 x:collection1_shard1_replica_n2 ]
o.a.s.u.RandomMergePolicy RandomMergePolicy wrapping class
org.apache.lucene.index.LogDocMergePolicy: [LogDocMergePolicy:
minMergeSize=1000, mergeFactor=32, maxMergeSize=9223372036854775807,
maxMergeSizeForForcedMerge=9223372036854775807, calibrateSizeByDeletes=false,
maxMergeDocs=2147483647, maxCFSSegmentSizeMB=8.796093022207999E12,
noCFSRatio=0.0]
[junit4] 2> 130608 INFO
(searcherExecutor-1579-thread-1-processing-n:127.0.0.1:64736_
x:collection1_shard2_replica_n1 c:collection1 s:shard2) [n:127.0.0.1:64736_
c:collection1 s:shard2 x:collection1_shard2_replica_n1 ] o.a.s.c.SolrCore
[collection1_shard2_replica_n1] Registered new searcher autowarm time: 0 ms
[junit4] 2> 130610 INFO (qtp1041122635-2228) [n:127.0.0.1:64696_
c:collection1 s:shard1 x:collection1_shard1_replica_n2 ]
o.a.s.r.ManagedResourceStorage Configured ZooKeeperStorageIO with znodeBase:
/configs/conf1
[junit4] 2> 130611 INFO (qtp1041122635-2228) [n:127.0.0.1:64696_
c:collection1 s:shard1 x:collection1_shard1_replica_n2 ]
o.a.s.r.ManagedResourceStorage Loaded null at path _rest_managed.json using
ZooKeeperStorageIO:path=/configs/conf1
[junit4] 2> 130611 INFO (qtp1041122635-2228) [n:127.0.0.1:64696_
c:collection1 s:shard1 x:collection1_shard1_replica_n2 ]
o.a.s.h.ReplicationHandler Commits will be reserved for 10000 ms
[junit4] 2> 130613 INFO (qtp1041122635-2228) [n:127.0.0.1:64696_
c:collection1 s:shard1 x:collection1_shard1_replica_n2 ] o.a.s.u.UpdateLog
Could not find max version in index or recent updates, using new clock
1679670384831496192
[junit4] 2> 130630 INFO
(searcherExecutor-1581-thread-1-processing-n:127.0.0.1:64696_
x:collection1_shard1_replica_n2 c:collection1 s:shard1) [n:127.0.0.1:64696_
c:collection1 s:shard1 x:collection1_shard1_replica_n2 ] o.a.s.c.SolrCore
[collection1_shard1_replica_n2] Registered new searcher autowarm time: 0 ms
[junit4] 2> 130668 INFO (qtp83972460-2258) [n:127.0.0.1:64736_
c:collection1 s:shard2 x:collection1_shard2_replica_n1 ] o.a.s.c.ZkShardTerms
Successful update of terms at /collections/collection1/terms/shard2 to
Terms{values={core_node3=0}, version=0}
[junit4] 2> 130668 INFO (qtp83972460-2258) [n:127.0.0.1:64736_
c:collection1 s:shard2 x:collection1_shard2_replica_n1 ]
o.a.s.c.ShardLeaderElectionContextBase make sure parent is created
/collections/collection1/leaders/shard2
[junit4] 2> 130702 INFO (qtp1041122635-2228) [n:127.0.0.1:64696_
c:collection1 s:shard1 x:collection1_shard1_replica_n2 ] o.a.s.c.ZkShardTerms
Successful update of terms at /collections/collection1/terms/shard1 to
Terms{values={core_node4=0}, version=0}
[junit4] 2> 130702 INFO (qtp1041122635-2228) [n:127.0.0.1:64696_
c:collection1 s:shard1 x:collection1_shard1_replica_n2 ]
o.a.s.c.ShardLeaderElectionContextBase make sure parent is created
/collections/collection1/leaders/shard1
[junit4] 2> 130720 INFO (qtp83972460-2258) [n:127.0.0.1:64736_
c:collection1 s:shard2 x:collection1_shard2_replica_n1 ]
o.a.s.c.ShardLeaderElectionContext Enough replicas found to continue.
[junit4] 2> 130720 INFO (qtp83972460-2258) [n:127.0.0.1:64736_
c:collection1 s:shard2 x:collection1_shard2_replica_n1 ]
o.a.s.c.ShardLeaderElectionContext I may be the new leader - try and sync
[junit4] 2> 130720 INFO (qtp83972460-2258) [n:127.0.0.1:64736_
c:collection1 s:shard2 x:collection1_shard2_replica_n1 ] o.a.s.c.SyncStrategy
Sync replicas to http://127.0.0.1:64736/collection1_shard2_replica_n1/
[junit4] 2> 130720 INFO (qtp83972460-2258) [n:127.0.0.1:64736_
c:collection1 s:shard2 x:collection1_shard2_replica_n1 ] o.a.s.c.SyncStrategy
Sync Success - now sync replicas to me
[junit4] 2> 130720 INFO (qtp83972460-2258) [n:127.0.0.1:64736_
c:collection1 s:shard2 x:collection1_shard2_replica_n1 ] o.a.s.c.SyncStrategy
http://127.0.0.1:64736/collection1_shard2_replica_n1/ has no replicas
[junit4] 2> 130720 INFO (qtp83972460-2258) [n:127.0.0.1:64736_
c:collection1 s:shard2 x:collection1_shard2_replica_n1 ]
o.a.s.c.ShardLeaderElectionContextBase Creating lead
[...truncated too long message...]
[junit4] 2> 4 /solr/security.json
[junit4] 2> 4 /solr/configs/conf1
[junit4] 2> 3
/solr/collections/collection1/collectionprops.json
[junit4] 2> 3
/solr/collections/ocptest_shardsplit2/terms/shard2_0
[junit4] 2> 3
/solr/collections/ocptest_shardsplit2/terms/shard1_1
[junit4] 2> 3
/solr/collections/ocptest_shardsplit2/terms/shard1_0
[junit4] 2> 3
/solr/collections/control_collection/terms/shard1
[junit4] 2> 3
/solr/collections/ocptest_shardsplit2/terms/shard2_1
[junit4] 2> 3 /solr/collections/collection1/terms/shard1
[junit4] 2> 3
/solr/collections/ocptest_shardsplit2/collectionprops.json
[junit4] 2> 2
/solr/collections/ocptest_shardsplit2/terms/shard2
[junit4] 2> 2
/solr/collections/ocptest_shardsplit2/terms/shard3
[junit4] 2> 2
/solr/collections/ocptest_shardsplit2/terms/shard1
[junit4] 2> 2 /solr/collections/ocptest1/terms/shard1
[junit4] 2> 2 /solr/collections/ocptest2/terms/shard1
[junit4] 2> 2 /solr/collections/ocptest2/terms/shard2
[junit4] 2> 2 /solr/collections/ocptest3/terms/shard2
[junit4] 2> 2 /solr/collections/ocptest3/terms/shard3
[junit4] 2> 2 /solr/collections/ocptest3/terms/shard1
[junit4] 2> 2 /solr/collections/collection1/terms/shard1_0
[junit4] 2> 2
/solr/collections/ocptest_shardsplit/terms/shard4
[junit4] 2> 2 /solr/collections/ocptest2/terms/shard3
[junit4] 2> 2
/solr/collections/ocptest_shardsplit/terms/shard3
[junit4] 2> 2
/solr/collections/ocptest_shardsplit/terms/shard2
[junit4] 2> 2 /solr/collections/ocptest1/terms/shard3
[junit4] 2> 2
/solr/collections/ocptest_shardsplit/terms/shard1
[junit4] 2> 2 /solr/collections/ocptest1/terms/shard2
[junit4] 2>
[junit4] 2> Maximum concurrent data watches above limit:
[junit4] 2>
[junit4] 2> 132 /solr/collections/ocptest_shardsplit2/state.json
[junit4] 2> 70 /solr/clusterstate.json
[junit4] 2> 69 /solr/collections/ocptest_shardsplit/state.json
[junit4] 2> 33 /solr/collections/ocptest3/state.json
[junit4] 2> 33 /solr/collections/ocptest2/state.json
[junit4] 2> 30 /solr/collections/ocptest1/state.json
[junit4] 2> 12 /solr/collections/control_collection/state.json
[junit4] 2> 6 /solr/clusterprops.json
[junit4] 2>
[junit4] 2> Maximum concurrent children watches above limit:
[junit4] 2>
[junit4] 2> 109 /solr/overseer/queue
[junit4] 2> 68 /solr/overseer/collection-queue-work
[junit4] 2> 31 /solr/collections
[junit4] 2> 22 /solr/live_nodes
[junit4] 2>
[junit4] 2> 83434 INFO
(TEST-MultiThreadedOCPTest.test-seed#[DEE62991148E9A5B]) [ ]
o.a.s.c.ZkTestServer waitForServerDown: 127.0.0.1:51926
[junit4] 2> 83434 INFO
(TEST-MultiThreadedOCPTest.test-seed#[DEE62991148E9A5B]) [ ]
o.a.s.c.ZkTestServer parse host and port list: 127.0.0.1:51926
[junit4] 2> 83434 INFO
(TEST-MultiThreadedOCPTest.test-seed#[DEE62991148E9A5B]) [ ]
o.a.s.c.ZkTestServer connecting to 127.0.0.1 51926
[junit4] 2> NOTE: reproduce with: ant test
-Dtestcase=MultiThreadedOCPTest -Dtests.method=test
-Dtests.seed=DEE62991148E9A5B -Dtests.slow=true -Dtests.badapples=true
-Dtests.locale=en-VC -Dtests.timezone=America/Detroit -Dtests.asserts=true
-Dtests.file.encoding=ISO-8859-1
[junit4] FAILURE 71.8s J0 | MultiThreadedOCPTest.test <<<
[junit4] > Throwable #1: java.lang.AssertionError: acoll: 1601862268189
bcoll: 1601862268242
[junit4] > at
__randomizedtesting.SeedInfo.seed([DEE62991148E9A5B:56B2164BBA72F7A3]:0)
[junit4] > at
org.apache.solr.cloud.MultiThreadedOCPTest.testFillWorkQueue(MultiThreadedOCPTest.java:113)
[junit4] > at
org.apache.solr.cloud.MultiThreadedOCPTest.test(MultiThreadedOCPTest.java:68)
[junit4] > at
java.base/jdk.internal.reflect.NativeMethodAccessorImpl.invoke0(Native Method)
[junit4] > at
java.base/jdk.internal.reflect.NativeMethodAccessorImpl.invoke(NativeMethodAccessorImpl.java:62)
[junit4] > at
java.base/jdk.internal.reflect.DelegatingMethodAccessorImpl.invoke(DelegatingMethodAccessorImpl.java:43)
[junit4] > at
java.base/java.lang.reflect.Method.invoke(Method.java:567)
[junit4] > at
org.apache.solr.BaseDistributedSearchTestCase$ShardsRepeatRule$ShardsFixedStatement.callStatement(BaseDistributedSearchTestCase.java:1090)
[junit4] > at
org.apache.solr.BaseDistributedSearchTestCase$ShardsRepeatRule$ShardsStatement.evaluate(BaseDistributedSearchTestCase.java:1061)
[junit4] > at java.base/java.lang.Thread.run(Thread.java:830)
[junit4] 2> NOTE: leaving temporary files on disk at:
C:\Users\jenkins\workspace\Lucene-Solr-8.x-Windows\solr\build\solr-core\test\J0\temp\solr.cloud.MultiThreadedOCPTest_DEE62991148E9A5B-001
[junit4] 2> NOTE: test params are: codec=Asserting(Lucene87):
{multiDefault=PostingsFormat(name=Direct), _root_=Lucene84,
id=TestBloomFilteredLucenePostings(BloomFilteringPostingsFormat(Lucene84))},
docValues:{range_facet_l_dv=DocValuesFormat(name=Direct),
_version_=DocValuesFormat(name=Lucene80),
intDefault=DocValuesFormat(name=Lucene80),
id_i1=DocValuesFormat(name=Lucene80),
range_facet_i_dv=DocValuesFormat(name=Lucene80),
intDvoDefault=DocValuesFormat(name=Asserting),
range_facet_l=DocValuesFormat(name=Lucene80),
timestamp=DocValuesFormat(name=Lucene80)}, maxPointsInLeafNode=1511,
maxMBSortInHeap=6.064088931125058,
sim=Asserting(RandomSimilarity(queryNorm=false): {}), locale=en-VC,
timezone=America/Detroit
[junit4] 2> NOTE: Windows 10 10.0 amd64/AdoptOpenJDK 13.0.2
(64-bit)/cpus=6,threads=1,free=123755128,total=327155712
[junit4] 2> NOTE: All tests run in this JVM: [MultiThreadedOCPTest]
[junit4] Completed [5/5 (1!)] on J0 in 83.26s, 1 test, 1 failure <<<
FAILURES!
[...truncated 13 lines...]
BUILD FAILED
C:\Users\jenkins\workspace\Lucene-Solr-8.x-Windows\lucene\common-build.xml:1599:
The following error occurred while executing this line:
C:\Users\jenkins\workspace\Lucene-Solr-8.x-Windows\lucene\common-build.xml:1126:
There were test failures: 5 suites, 5 tests, 1 failure [seed: DEE62991148E9A5B]
Total time: 1 minute 28 seconds
[repro] Setting last failure code to 1
[repro] Failures w/original seeds:
[repro] 1/5 failed: org.apache.solr.cloud.MultiThreadedOCPTest
[repro] Exiting with code 1
C:\Users\jenkins\workspace\Lucene-Solr-8.x-Windows>IF EXIST lucene\build move
/y lucene\build lucene\build.repro
1 dir(s) moved.
C:\Users\jenkins\workspace\Lucene-Solr-8.x-Windows>IF EXIST solr\build move /y
solr\build solr\build.repro
1 dir(s) moved.
C:\Users\jenkins\workspace\Lucene-Solr-8.x-Windows>IF EXIST lucene\build.orig
move /y lucene\build.orig lucene\build
1 dir(s) moved.
C:\Users\jenkins\workspace\Lucene-Solr-8.x-Windows>IF EXIST solr\build.orig
move /y solr\build.orig solr\build
1 dir(s) moved.
C:\Users\jenkins\workspace\Lucene-Solr-8.x-Windows>exit 0
Setting
ANT_1_8_2_HOME=C:\Users\jenkins\tools\hudson.tasks.Ant_AntInstallation\ANT_1.8.2
Archiving artifacts
[Java] Sleeping for 5 seconds due to JENKINS-32191...
[Java] Parsing console log (workspace:
'C:\Users\jenkins\workspace\Lucene-Solr-8.x-Windows')
[Java] Successfully parsed console log
[Java] -> found 112 issues (skipped 103 duplicates)
[Java] Post processing issues on 'Windows VBOX' with source code encoding
'UTF-8'
[Java] Creating SCM blamer to obtain author and commit information for affected
files
[Java] Creating SCM miner to obtain statistics for affected repository files
[Java] Resolving file names for all issues in source directory
'C:\Users\jenkins\workspace\Lucene-Solr-8.x-Windows'
[Java] -> resolved paths in source directory (53 found, 0 not found)
[Java] Resolving module names from module definitions (build.xml, pom.xml, or
Manifest.mf files)
[Java] -> resolved module names for 112 issues
[Java] Resolving package names (or namespaces) by parsing the affected files
[Java] -> resolved package names of 53 affected files
[Java] No filter has been set, publishing all 112 issues
[Java] Creating fingerprints for all affected code blocks to track issues over
different builds
[Java] -> created fingerprints for 112 issues (skipped 0 issues)
[Java] Copying affected files to Jenkins' build folder
'/home/jenkins/jobs/Lucene-Solr-8.x-Windows/builds/1696/files-with-issues'
[Java] -> 53 copied, 0 not in workspace, 0 not-found, 0 with I/O error
[Java] Using reference build 'Lucene-Solr-8.x-Windows #1695' to compute new,
fixed, and outstanding issues
[Java] Issues delta (vs. reference build): outstanding: 112, new: 0, fixed: 0
[Java] No quality gates have been set - skipping
[Java] Health report is disabled - skipping
[Java] Created analysis result for 112 issues (found 0 new issues, fixed 0
issues)
[Java] Attaching ResultAction with ID 'java' to run 'Lucene-Solr-8.x-Windows
#1696'.
[Checks API] No suitable checks publisher found.
Setting
ANT_1_8_2_HOME=C:\Users\jenkins\tools\hudson.tasks.Ant_AntInstallation\ANT_1.8.2
Recording test results
Setting
ANT_1_8_2_HOME=C:\Users\jenkins\tools\hudson.tasks.Ant_AntInstallation\ANT_1.8.2
Build step 'Publish JUnit test result report' changed build result to UNSTABLE
[Checks API] No suitable checks publisher found.
Email was triggered for: Unstable (Test Failures)
Sending email for trigger: Unstable (Test Failures)
Setting
ANT_1_8_2_HOME=C:\Users\jenkins\tools\hudson.tasks.Ant_AntInstallation\ANT_1.8.2
Setting
ANT_1_8_2_HOME=C:\Users\jenkins\tools\hudson.tasks.Ant_AntInstallation\ANT_1.8.2
Setting
ANT_1_8_2_HOME=C:\Users\jenkins\tools\hudson.tasks.Ant_AntInstallation\ANT_1.8.2
Setting
ANT_1_8_2_HOME=C:\Users\jenkins\tools\hudson.tasks.Ant_AntInstallation\ANT_1.8.2
Setting
ANT_1_8_2_HOME=C:\Users\jenkins\tools\hudson.tasks.Ant_AntInstallation\ANT_1.8.2
Setting
ANT_1_8_2_HOME=C:\Users\jenkins\tools\hudson.tasks.Ant_AntInstallation\ANT_1.8.2
---------------------------------------------------------------------
To unsubscribe, e-mail: [email protected]
For additional commands, e-mail: [email protected]
