Build: https://builds.apache.org/job/Lucene-Solr-NightlyTests-6.x/6/
5 tests failed. FAILED: org.apache.solr.cloud.CdcrReplicationHandlerTest.testReplicationWithBufferedUpdates Error Message: Timeout while trying to assert number of documents @ source_collection Stack Trace: java.lang.AssertionError: Timeout while trying to assert number of documents @ source_collection at __randomizedtesting.SeedInfo.seed([D1ADDC59DD26247E:2A48C4798B5B8E9]:0) at org.apache.solr.cloud.BaseCdcrDistributedZkTest.assertNumDocs(BaseCdcrDistributedZkTest.java:267) at org.apache.solr.cloud.CdcrReplicationHandlerTest.testReplicationWithBufferedUpdates(CdcrReplicationHandlerTest.java:233) at sun.reflect.NativeMethodAccessorImpl.invoke0(Native Method) at sun.reflect.NativeMethodAccessorImpl.invoke(NativeMethodAccessorImpl.java:62) at sun.reflect.DelegatingMethodAccessorImpl.invoke(DelegatingMethodAccessorImpl.java:43) at java.lang.reflect.Method.invoke(Method.java:497) at com.carrotsearch.randomizedtesting.RandomizedRunner.invoke(RandomizedRunner.java:1764) at com.carrotsearch.randomizedtesting.RandomizedRunner$8.evaluate(RandomizedRunner.java:871) at com.carrotsearch.randomizedtesting.RandomizedRunner$9.evaluate(RandomizedRunner.java:907) at com.carrotsearch.randomizedtesting.RandomizedRunner$10.evaluate(RandomizedRunner.java:921) at org.apache.solr.BaseDistributedSearchTestCase$ShardsRepeatRule$ShardsFixedStatement.callStatement(BaseDistributedSearchTestCase.java:996) at org.apache.solr.BaseDistributedSearchTestCase$ShardsRepeatRule$ShardsStatement.evaluate(BaseDistributedSearchTestCase.java:971) 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:367) at com.carrotsearch.randomizedtesting.ThreadLeakControl.forkTimeoutingTask(ThreadLeakControl.java:809) at com.carrotsearch.randomizedtesting.ThreadLeakControl$3.evaluate(ThreadLeakControl.java:460) at com.carrotsearch.randomizedtesting.RandomizedRunner.runSingleTest(RandomizedRunner.java:880) at com.carrotsearch.randomizedtesting.RandomizedRunner$5.evaluate(RandomizedRunner.java:781) at com.carrotsearch.randomizedtesting.RandomizedRunner$6.evaluate(RandomizedRunner.java:816) at com.carrotsearch.randomizedtesting.RandomizedRunner$7.evaluate(RandomizedRunner.java:827) at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36) at com.carrotsearch.randomizedtesting.rules.SystemPropertiesRestoreRule$1.evaluate(SystemPropertiesRestoreRule.java:57) at org.apache.lucene.util.AbstractBeforeAfterRule$1.evaluate(AbstractBeforeAfterRule.java:45) at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36) at org.apache.lucene.util.TestRuleStoreClassName$1.evaluate(TestRuleStoreClassName.java:41) at com.carrotsearch.randomizedtesting.rules.NoShadowingOrOverridesOnMethodsRule$1.evaluate(NoShadowingOrOverridesOnMethodsRule.java:40) at com.carrotsearch.randomizedtesting.rules.NoShadowingOrOverridesOnMethodsRule$1.evaluate(NoShadowingOrOverridesOnMethodsRule.java:40) at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36) at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36) at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36) at org.apache.lucene.util.TestRuleAssertionsRequired$1.evaluate(TestRuleAssertionsRequired.java:53) at org.apache.lucene.util.TestRuleMarkFailure$1.evaluate(TestRuleMarkFailure.java:47) at org.apache.lucene.util.TestRuleIgnoreAfterMaxFailures$1.evaluate(TestRuleIgnoreAfterMaxFailures.java:64) at org.apache.lucene.util.TestRuleIgnoreTestSuites$1.evaluate(TestRuleIgnoreTestSuites.java:54) at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36) at com.carrotsearch.randomizedtesting.ThreadLeakControl$StatementRunner.run(ThreadLeakControl.java:367) at java.lang.Thread.run(Thread.java:745) Caused by: java.lang.AssertionError: expected:<2860> but was:<2870> at org.junit.Assert.fail(Assert.java:93) at org.junit.Assert.failNotEquals(Assert.java:647) at org.junit.Assert.assertEquals(Assert.java:128) at org.junit.Assert.assertEquals(Assert.java:472) at org.junit.Assert.assertEquals(Assert.java:456) at org.apache.solr.cloud.BaseCdcrDistributedZkTest.assertNumDocs(BaseCdcrDistributedZkTest.java:258) ... 42 more FAILED: org.apache.solr.cloud.CollectionsAPIDistributedZkTest.test Error Message: Captured an uncaught exception in thread: Thread[id=23907, name=collection0, state=RUNNABLE, group=TGRP-CollectionsAPIDistributedZkTest] Stack Trace: com.carrotsearch.randomizedtesting.UncaughtExceptionError: Captured an uncaught exception in thread: Thread[id=23907, name=collection0, state=RUNNABLE, group=TGRP-CollectionsAPIDistributedZkTest] Caused by: org.apache.solr.client.solrj.impl.HttpSolrClient$RemoteSolrException: Error from server at http://127.0.0.1:55616: collection already exists: awholynewstresscollection_collection0_7 at __randomizedtesting.SeedInfo.seed([D1ADDC59DD26247E]:0) at org.apache.solr.client.solrj.impl.HttpSolrClient.executeMethod(HttpSolrClient.java:577) at org.apache.solr.client.solrj.impl.HttpSolrClient.request(HttpSolrClient.java:241) at org.apache.solr.client.solrj.impl.HttpSolrClient.request(HttpSolrClient.java:230) at org.apache.solr.client.solrj.impl.LBHttpSolrClient.doRequest(LBHttpSolrClient.java:372) at org.apache.solr.client.solrj.impl.LBHttpSolrClient.request(LBHttpSolrClient.java:325) at org.apache.solr.client.solrj.impl.CloudSolrClient.sendRequest(CloudSolrClient.java:1100) at org.apache.solr.client.solrj.impl.CloudSolrClient.requestWithRetryOnStaleState(CloudSolrClient.java:870) at org.apache.solr.client.solrj.impl.CloudSolrClient.request(CloudSolrClient.java:806) at org.apache.solr.client.solrj.SolrClient.request(SolrClient.java:1219) at org.apache.solr.cloud.AbstractFullDistribZkTestBase.createCollection(AbstractFullDistribZkTestBase.java:1593) at org.apache.solr.cloud.AbstractFullDistribZkTestBase.createCollection(AbstractFullDistribZkTestBase.java:1614) at org.apache.solr.cloud.CollectionsAPIDistributedZkTest$1CollectionThread.run(CollectionsAPIDistributedZkTest.java:970) FAILED: org.apache.solr.cloud.RollingRestartTest.test Error Message: Unable to restart (#1): CloudJettyRunner [url=http://127.0.0.1:32919/qjx/cp/collection1] Stack Trace: java.lang.AssertionError: Unable to restart (#1): CloudJettyRunner [url=http://127.0.0.1:32919/qjx/cp/collection1] at __randomizedtesting.SeedInfo.seed([D1ADDC59DD26247E:59F9E38373DA4986]:0) at org.junit.Assert.fail(Assert.java:93) at org.junit.Assert.assertTrue(Assert.java:43) at org.apache.solr.cloud.RollingRestartTest.restartWithRolesTest(RollingRestartTest.java:103) at org.apache.solr.cloud.RollingRestartTest.test(RollingRestartTest.java:52) at sun.reflect.NativeMethodAccessorImpl.invoke0(Native Method) at sun.reflect.NativeMethodAccessorImpl.invoke(NativeMethodAccessorImpl.java:62) at sun.reflect.DelegatingMethodAccessorImpl.invoke(DelegatingMethodAccessorImpl.java:43) at java.lang.reflect.Method.invoke(Method.java:497) at com.carrotsearch.randomizedtesting.RandomizedRunner.invoke(RandomizedRunner.java:1764) at com.carrotsearch.randomizedtesting.RandomizedRunner$8.evaluate(RandomizedRunner.java:871) at com.carrotsearch.randomizedtesting.RandomizedRunner$9.evaluate(RandomizedRunner.java:907) at com.carrotsearch.randomizedtesting.RandomizedRunner$10.evaluate(RandomizedRunner.java:921) at org.apache.solr.BaseDistributedSearchTestCase$ShardsRepeatRule$ShardsFixedStatement.callStatement(BaseDistributedSearchTestCase.java:996) at org.apache.solr.BaseDistributedSearchTestCase$ShardsRepeatRule$ShardsStatement.evaluate(BaseDistributedSearchTestCase.java:971) 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:367) at com.carrotsearch.randomizedtesting.ThreadLeakControl.forkTimeoutingTask(ThreadLeakControl.java:809) at com.carrotsearch.randomizedtesting.ThreadLeakControl$3.evaluate(ThreadLeakControl.java:460) at com.carrotsearch.randomizedtesting.RandomizedRunner.runSingleTest(RandomizedRunner.java:880) at com.carrotsearch.randomizedtesting.RandomizedRunner$5.evaluate(RandomizedRunner.java:781) at com.carrotsearch.randomizedtesting.RandomizedRunner$6.evaluate(RandomizedRunner.java:816) at com.carrotsearch.randomizedtesting.RandomizedRunner$7.evaluate(RandomizedRunner.java:827) at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36) at com.carrotsearch.randomizedtesting.rules.SystemPropertiesRestoreRule$1.evaluate(SystemPropertiesRestoreRule.java:57) at org.apache.lucene.util.AbstractBeforeAfterRule$1.evaluate(AbstractBeforeAfterRule.java:45) at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36) at org.apache.lucene.util.TestRuleStoreClassName$1.evaluate(TestRuleStoreClassName.java:41) at com.carrotsearch.randomizedtesting.rules.NoShadowingOrOverridesOnMethodsRule$1.evaluate(NoShadowingOrOverridesOnMethodsRule.java:40) at com.carrotsearch.randomizedtesting.rules.NoShadowingOrOverridesOnMethodsRule$1.evaluate(NoShadowingOrOverridesOnMethodsRule.java:40) at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36) at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36) at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36) at org.apache.lucene.util.TestRuleAssertionsRequired$1.evaluate(TestRuleAssertionsRequired.java:53) at org.apache.lucene.util.TestRuleMarkFailure$1.evaluate(TestRuleMarkFailure.java:47) at org.apache.lucene.util.TestRuleIgnoreAfterMaxFailures$1.evaluate(TestRuleIgnoreAfterMaxFailures.java:64) at org.apache.lucene.util.TestRuleIgnoreTestSuites$1.evaluate(TestRuleIgnoreTestSuites.java:54) at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36) at com.carrotsearch.randomizedtesting.ThreadLeakControl$StatementRunner.run(ThreadLeakControl.java:367) at java.lang.Thread.run(Thread.java:745) FAILED: org.apache.solr.cloud.UnloadDistributedZkTest.test Error Message: Captured an uncaught exception in thread: Thread[id=23099, name=testExecutor-5295-thread-1, state=RUNNABLE, group=TGRP-UnloadDistributedZkTest] Stack Trace: com.carrotsearch.randomizedtesting.UncaughtExceptionError: Captured an uncaught exception in thread: Thread[id=23099, name=testExecutor-5295-thread-1, state=RUNNABLE, group=TGRP-UnloadDistributedZkTest] Caused by: java.lang.RuntimeException: org.apache.solr.client.solrj.SolrServerException: Timeout occured while waiting response from server at: http://127.0.0.1:46362/ev_t at __randomizedtesting.SeedInfo.seed([D1ADDC59DD26247E]:0) at org.apache.solr.cloud.BasicDistributedZkTest.lambda$createCores$3(BasicDistributedZkTest.java:583) at org.apache.solr.common.util.ExecutorUtil$MDCAwareThreadPoolExecutor.lambda$execute$6(ExecutorUtil.java:229) at java.util.concurrent.ThreadPoolExecutor.runWorker(ThreadPoolExecutor.java:1142) at java.util.concurrent.ThreadPoolExecutor$Worker.run(ThreadPoolExecutor.java:617) at java.lang.Thread.run(Thread.java:745) Caused by: org.apache.solr.client.solrj.SolrServerException: Timeout occured while waiting response from server at: http://127.0.0.1:46362/ev_t at org.apache.solr.client.solrj.impl.HttpSolrClient.executeMethod(HttpSolrClient.java:588) at org.apache.solr.client.solrj.impl.HttpSolrClient.request(HttpSolrClient.java:241) at org.apache.solr.client.solrj.impl.HttpSolrClient.request(HttpSolrClient.java:230) at org.apache.solr.client.solrj.SolrClient.request(SolrClient.java:1219) at org.apache.solr.cloud.BasicDistributedZkTest.lambda$createCores$3(BasicDistributedZkTest.java:581) ... 4 more Caused by: java.net.SocketTimeoutException: Read timed out at java.net.SocketInputStream.socketRead0(Native Method) at java.net.SocketInputStream.socketRead(SocketInputStream.java:116) at java.net.SocketInputStream.read(SocketInputStream.java:170) at java.net.SocketInputStream.read(SocketInputStream.java:141) at org.apache.http.impl.io.AbstractSessionInputBuffer.fillBuffer(AbstractSessionInputBuffer.java:160) at org.apache.http.impl.io.SocketInputBuffer.fillBuffer(SocketInputBuffer.java:84) at org.apache.http.impl.io.AbstractSessionInputBuffer.readLine(AbstractSessionInputBuffer.java:273) at org.apache.http.impl.conn.DefaultHttpResponseParser.parseHead(DefaultHttpResponseParser.java:140) at org.apache.http.impl.conn.DefaultHttpResponseParser.parseHead(DefaultHttpResponseParser.java:57) at org.apache.http.impl.io.AbstractMessageParser.parse(AbstractMessageParser.java:261) at org.apache.http.impl.AbstractHttpClientConnection.receiveResponseHeader(AbstractHttpClientConnection.java:283) at org.apache.http.impl.conn.DefaultClientConnection.receiveResponseHeader(DefaultClientConnection.java:251) at org.apache.http.impl.conn.ManagedClientConnectionImpl.receiveResponseHeader(ManagedClientConnectionImpl.java:197) at org.apache.http.protocol.HttpRequestExecutor.doReceiveResponse(HttpRequestExecutor.java:272) at org.apache.http.protocol.HttpRequestExecutor.execute(HttpRequestExecutor.java:124) at org.apache.http.impl.client.DefaultRequestDirector.tryExecute(DefaultRequestDirector.java:685) at org.apache.http.impl.client.DefaultRequestDirector.execute(DefaultRequestDirector.java:487) at org.apache.http.impl.client.AbstractHttpClient.doExecute(AbstractHttpClient.java:882) at org.apache.http.impl.client.CloseableHttpClient.execute(CloseableHttpClient.java:82) at org.apache.http.impl.client.CloseableHttpClient.execute(CloseableHttpClient.java:107) at org.apache.http.impl.client.CloseableHttpClient.execute(CloseableHttpClient.java:55) at org.apache.solr.client.solrj.impl.HttpSolrClient.executeMethod(HttpSolrClient.java:482) ... 8 more FAILED: junit.framework.TestSuite.org.apache.solr.handler.TestReplicationHandler Error Message: ObjectTracker found 2 object(s) that were not released!!! [NRTCachingDirectory, NRTCachingDirectory] Stack Trace: java.lang.AssertionError: ObjectTracker found 2 object(s) that were not released!!! [NRTCachingDirectory, NRTCachingDirectory] at __randomizedtesting.SeedInfo.seed([D1ADDC59DD26247E]:0) at org.junit.Assert.fail(Assert.java:93) at org.junit.Assert.assertTrue(Assert.java:43) at org.junit.Assert.assertNull(Assert.java:551) at org.apache.solr.SolrTestCaseJ4.afterClass(SolrTestCaseJ4.java:238) at sun.reflect.GeneratedMethodAccessor51.invoke(Unknown Source) at sun.reflect.DelegatingMethodAccessorImpl.invoke(DelegatingMethodAccessorImpl.java:43) at java.lang.reflect.Method.invoke(Method.java:497) at com.carrotsearch.randomizedtesting.RandomizedRunner.invoke(RandomizedRunner.java:1764) at com.carrotsearch.randomizedtesting.RandomizedRunner$7.evaluate(RandomizedRunner.java:834) at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36) at com.carrotsearch.randomizedtesting.rules.SystemPropertiesRestoreRule$1.evaluate(SystemPropertiesRestoreRule.java:57) at org.apache.lucene.util.AbstractBeforeAfterRule$1.evaluate(AbstractBeforeAfterRule.java:45) at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36) at org.apache.lucene.util.TestRuleStoreClassName$1.evaluate(TestRuleStoreClassName.java:41) at com.carrotsearch.randomizedtesting.rules.NoShadowingOrOverridesOnMethodsRule$1.evaluate(NoShadowingOrOverridesOnMethodsRule.java:40) at com.carrotsearch.randomizedtesting.rules.NoShadowingOrOverridesOnMethodsRule$1.evaluate(NoShadowingOrOverridesOnMethodsRule.java:40) at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36) at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36) at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36) at org.apache.lucene.util.TestRuleAssertionsRequired$1.evaluate(TestRuleAssertionsRequired.java:53) at org.apache.lucene.util.TestRuleMarkFailure$1.evaluate(TestRuleMarkFailure.java:47) at org.apache.lucene.util.TestRuleIgnoreAfterMaxFailures$1.evaluate(TestRuleIgnoreAfterMaxFailures.java:64) at org.apache.lucene.util.TestRuleIgnoreTestSuites$1.evaluate(TestRuleIgnoreTestSuites.java:54) at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36) at com.carrotsearch.randomizedtesting.ThreadLeakControl$StatementRunner.run(ThreadLeakControl.java:367) at java.lang.Thread.run(Thread.java:745) Build Log: [...truncated 11698 lines...] [junit4] Suite: org.apache.solr.handler.TestReplicationHandler [junit4] 2> Creating dataDir: /x1/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-6.x/solr/build/solr-core/test/J0/temp/solr.handler.TestReplicationHandler_D1ADDC59DD26247E-001/init-core-data-001 [junit4] 2> 1566264 INFO (TEST-TestReplicationHandler.testEmptyCommits-seed#[D1ADDC59DD26247E]) [ ] o.a.s.SolrTestCaseJ4 ###Starting testEmptyCommits [junit4] 2> 1566265 INFO (TEST-TestReplicationHandler.testEmptyCommits-seed#[D1ADDC59DD26247E]) [ ] o.a.s.SolrTestCaseJ4 Writing core.properties file to /x1/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-6.x/solr/build/solr-core/test/J0/temp/solr.handler.TestReplicationHandler_D1ADDC59DD26247E-001/solr-instance-001/collection1 [junit4] 2> 1566270 INFO (TEST-TestReplicationHandler.testEmptyCommits-seed#[D1ADDC59DD26247E]) [ ] o.e.j.s.Server jetty-9.3.6.v20151106 [junit4] 2> 1566272 INFO (TEST-TestReplicationHandler.testEmptyCommits-seed#[D1ADDC59DD26247E]) [ ] o.e.j.s.h.ContextHandler Started o.e.j.s.ServletContextHandler@6ec671ec{/solr,null,AVAILABLE} [junit4] 2> 1566274 INFO (TEST-TestReplicationHandler.testEmptyCommits-seed#[D1ADDC59DD26247E]) [ ] o.e.j.s.ServerConnector Started ServerConnector@3c74ae65{HTTP/1.1,[http/1.1]}{127.0.0.1:54644} [junit4] 2> 1566274 INFO (TEST-TestReplicationHandler.testEmptyCommits-seed#[D1ADDC59DD26247E]) [ ] o.e.j.s.Server Started @1569246ms [junit4] 2> 1566274 INFO (TEST-TestReplicationHandler.testEmptyCommits-seed#[D1ADDC59DD26247E]) [ ] o.a.s.c.s.e.JettySolrRunner Jetty properties: {solr.data.dir=/x1/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-6.x/solr/build/solr-core/test/J0/temp/solr.handler.TestReplicationHandler_D1ADDC59DD26247E-001/solr-instance-001/collection1/data, hostContext=/solr, hostPort=54644} [junit4] 2> 1566274 INFO (TEST-TestReplicationHandler.testEmptyCommits-seed#[D1ADDC59DD26247E]) [ ] o.a.s.s.SolrDispatchFilter SolrDispatchFilter.init(): sun.misc.Launcher$AppClassLoader@4e0e2f2a [junit4] 2> 1566275 INFO (TEST-TestReplicationHandler.testEmptyCommits-seed#[D1ADDC59DD26247E]) [ ] o.a.s.c.SolrResourceLoader new SolrResourceLoader for directory: '/x1/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-6.x/solr/build/solr-core/test/J0/temp/solr.handler.TestReplicationHandler_D1ADDC59DD26247E-001/solr-instance-001' [junit4] 2> 1566275 INFO (TEST-TestReplicationHandler.testEmptyCommits-seed#[D1ADDC59DD26247E]) [ ] o.a.s.c.SolrResourceLoader JNDI not configured for solr (NoInitialContextEx) [junit4] 2> 1566275 INFO (TEST-TestReplicationHandler.testEmptyCommits-seed#[D1ADDC59DD26247E]) [ ] o.a.s.c.SolrResourceLoader solr home defaulted to 'solr/' (could not find system property or JNDI) [junit4] 2> 1566275 INFO (TEST-TestReplicationHandler.testEmptyCommits-seed#[D1ADDC59DD26247E]) [ ] o.a.s.c.SolrXmlConfig Loading container configuration from /x1/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-6.x/solr/build/solr-core/test/J0/temp/solr.handler.TestReplicationHandler_D1ADDC59DD26247E-001/solr-instance-001/solr.xml [junit4] 2> 1566280 INFO (TEST-TestReplicationHandler.testEmptyCommits-seed#[D1ADDC59DD26247E]) [ ] o.a.s.c.CorePropertiesLocator Config-defined core root directory: /x1/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-6.x/solr/build/solr-core/test/J0/temp/solr.handler.TestReplicationHandler_D1ADDC59DD26247E-001/solr-instance-001/. [junit4] 2> 1566281 INFO (TEST-TestReplicationHandler.testEmptyCommits-seed#[D1ADDC59DD26247E]) [ ] o.a.s.c.CoreContainer New CoreContainer 622504857 [junit4] 2> 1566281 INFO (TEST-TestReplicationHandler.testEmptyCommits-seed#[D1ADDC59DD26247E]) [ ] o.a.s.c.CoreContainer Loading cores into CoreContainer [instanceDir=/x1/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-6.x/solr/build/solr-core/test/J0/temp/solr.handler.TestReplicationHandler_D1ADDC59DD26247E-001/solr-instance-001] [junit4] 2> 1566281 WARN (TEST-TestReplicationHandler.testEmptyCommits-seed#[D1ADDC59DD26247E]) [ ] o.a.s.c.CoreContainer Couldn't add files from /x1/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-6.x/solr/build/solr-core/test/J0/temp/solr.handler.TestReplicationHandler_D1ADDC59DD26247E-001/solr-instance-001/lib to classpath: /x1/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-6.x/solr/build/solr-core/test/J0/temp/solr.handler.TestReplicationHandler_D1ADDC59DD26247E-001/solr-instance-001/lib [junit4] 2> 1566282 INFO (TEST-TestReplicationHandler.testEmptyCommits-seed#[D1ADDC59DD26247E]) [ ] o.a.s.h.c.HttpShardHandlerFactory created with socketTimeout : 90000,urlScheme : ,connTimeout : 15000,maxConnectionsPerHost : 20,maxConnections : 10000,corePoolSize : 0,maximumPoolSize : 2147483647,maxThreadIdleTime : 5,sizeOfQueue : -1,fairnessPolicy : false,useRetries : false, [junit4] 2> 1566283 INFO (TEST-TestReplicationHandler.testEmptyCommits-seed#[D1ADDC59DD26247E]) [ ] o.a.s.u.UpdateShardHandler Creating UpdateShardHandler HTTP client with params: socketTimeout=340000&connTimeout=45000&retry=true [junit4] 2> 1566283 INFO (TEST-TestReplicationHandler.testEmptyCommits-seed#[D1ADDC59DD26247E]) [ ] o.a.s.l.LogWatcher SLF4J impl is org.slf4j.impl.Log4jLoggerFactory [junit4] 2> 1566283 INFO (TEST-TestReplicationHandler.testEmptyCommits-seed#[D1ADDC59DD26247E]) [ ] o.a.s.l.LogWatcher Registering Log Listener [Log4j (org.slf4j.impl.Log4jLoggerFactory)] [junit4] 2> 1566284 INFO (TEST-TestReplicationHandler.testEmptyCommits-seed#[D1ADDC59DD26247E]) [ ] o.a.s.c.CoreContainer Security conf doesn't exist. Skipping setup for authorization module. [junit4] 2> 1566284 INFO (TEST-TestReplicationHandler.testEmptyCommits-seed#[D1ADDC59DD26247E]) [ ] o.a.s.c.CoreContainer No authentication plugin used. [junit4] 2> 1566284 INFO (TEST-TestReplicationHandler.testEmptyCommits-seed#[D1ADDC59DD26247E]) [ ] o.a.s.c.CorePropertiesLocator Looking for core definitions underneath /x1/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-6.x/solr/build/solr-core/test/J0/temp/solr.handler.TestReplicationHandler_D1ADDC59DD26247E-001/solr-instance-001/. [junit4] 2> 1566285 INFO (TEST-TestReplicationHandler.testEmptyCommits-seed#[D1ADDC59DD26247E]) [ ] o.a.s.c.CoreDescriptor Created CoreDescriptor: {name=collection1, config=solrconfig.xml, loadOnStartup=true, schema=schema.xml, configSetProperties=configsetprops.json, transient=false, dataDir=data/} [junit4] 2> 1566285 INFO (TEST-TestReplicationHandler.testEmptyCommits-seed#[D1ADDC59DD26247E]) [ ] o.a.s.c.CorePropertiesLocator Found core collection1 in /x1/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-6.x/solr/build/solr-core/test/J0/temp/solr.handler.TestReplicationHandler_D1ADDC59DD26247E-001/solr-instance-001/./collection1 [junit4] 2> 1566285 INFO (TEST-TestReplicationHandler.testEmptyCommits-seed#[D1ADDC59DD26247E]) [ ] o.a.s.c.CorePropertiesLocator Found 1 core definitions [junit4] 2> 1566286 INFO (coreLoadExecutor-2898-thread-1) [ ] o.a.s.c.SolrResourceLoader new SolrResourceLoader for directory: '/x1/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-6.x/solr/build/solr-core/test/J0/temp/solr.handler.TestReplicationHandler_D1ADDC59DD26247E-001/solr-instance-001/collection1' [junit4] 2> 1566291 INFO (coreLoadExecutor-2898-thread-1) [ ] o.a.s.c.SolrResourceLoader JNDI not configured for solr (NoInitialContextEx) [junit4] 2> 1566291 INFO (coreLoadExecutor-2898-thread-1) [ ] o.a.s.c.SolrResourceLoader solr home defaulted to 'solr/' (could not find system property or JNDI) [junit4] 2> 1566291 INFO (TEST-TestReplicationHandler.testEmptyCommits-seed#[D1ADDC59DD26247E]) [ ] o.a.s.s.SolrDispatchFilter user.dir=/x1/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-6.x/solr/build/solr-core/test/J0 [junit4] 2> 1566291 INFO (TEST-TestReplicationHandler.testEmptyCommits-seed#[D1ADDC59DD26247E]) [ ] o.a.s.s.SolrDispatchFilter SolrDispatchFilter.init() done [junit4] 2> 1566297 INFO (coreLoadExecutor-2898-thread-1) [ ] o.a.s.c.SolrConfig current version of requestparams : -1 [junit4] 2> 1566299 INFO (coreLoadExecutor-2898-thread-1) [ ] o.a.s.c.SolrConfig Using Lucene MatchVersion: 6.1.0 [junit4] 2> 1566305 INFO (coreLoadExecutor-2898-thread-1) [ ] o.a.s.c.SolrConfig Loaded SolrConfig: solrconfig.xml [junit4] 2> 1566307 INFO (coreLoadExecutor-2898-thread-1) [ ] o.a.s.s.IndexSchema [collection1] Schema name=test [junit4] 2> 1566309 INFO (coreLoadExecutor-2898-thread-1) [ ] o.a.s.s.IndexSchema unique key field: id [junit4] 2> 1566311 INFO (coreLoadExecutor-2898-thread-1) [ ] o.a.s.c.ConfigSetProperties Did not find ConfigSet properties, assuming default properties: Can't find resource 'configsetprops.json' in classpath or '/x1/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-6.x/solr/build/solr-core/test/J0/temp/solr.handler.TestReplicationHandler_D1ADDC59DD26247E-001/solr-instance-001/collection1' [junit4] 2> 1566311 INFO (coreLoadExecutor-2898-thread-1) [ ] o.a.s.c.CoreContainer Creating SolrCore 'collection1' using configuration from instancedir /x1/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-6.x/solr/build/solr-core/test/J0/temp/solr.handler.TestReplicationHandler_D1ADDC59DD26247E-001/solr-instance-001/./collection1 [junit4] 2> 1566311 INFO (coreLoadExecutor-2898-thread-1) [ x:collection1] o.a.s.c.SolrCore org.apache.solr.core.MockDirectoryFactory [junit4] 2> 1566311 INFO (coreLoadExecutor-2898-thread-1) [ x:collection1] o.a.s.c.SolrCore [[collection1] ] Opening new SolrCore at [/x1/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-6.x/solr/build/solr-core/test/J0/temp/solr.handler.TestReplicationHandler_D1ADDC59DD26247E-001/solr-instance-001/collection1], dataDir=[/x1/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-6.x/solr/build/solr-core/test/J0/temp/solr.handler.TestReplicationHandler_D1ADDC59DD26247E-001/solr-instance-001/./collection1/data/] [junit4] 2> 1566311 INFO (coreLoadExecutor-2898-thread-1) [ x:collection1] o.a.s.c.SolrCore JMX monitoring not detected for core: collection1 [junit4] 2> 1566312 INFO (coreLoadExecutor-2898-thread-1) [ x:collection1] o.a.s.c.CachingDirectoryFactory return new directory for /x1/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-6.x/solr/build/solr-core/test/J0/temp/solr.handler.TestReplicationHandler_D1ADDC59DD26247E-001/solr-instance-001/./collection1/data [junit4] 2> 1566312 INFO (coreLoadExecutor-2898-thread-1) [ x:collection1] o.a.s.c.SolrCore New index directory detected: old=null new=/x1/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-6.x/solr/build/solr-core/test/J0/temp/solr.handler.TestReplicationHandler_D1ADDC59DD26247E-001/solr-instance-001/./collection1/data/index/ [junit4] 2> 1566312 WARN (coreLoadExecutor-2898-thread-1) [ x:collection1] o.a.s.c.SolrCore [collection1] Solr index directory '/x1/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-6.x/solr/build/solr-core/test/J0/temp/solr.handler.TestReplicationHandler_D1ADDC59DD26247E-001/solr-instance-001/./collection1/data/index' doesn't exist. Creating new index... [junit4] 2> 1566313 INFO (coreLoadExecutor-2898-thread-1) [ x:collection1] o.a.s.c.CachingDirectoryFactory return new directory for /x1/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-6.x/solr/build/solr-core/test/J0/temp/solr.handler.TestReplicationHandler_D1ADDC59DD26247E-001/solr-instance-001/./collection1/data/index [junit4] 2> 1566313 INFO (coreLoadExecutor-2898-thread-1) [ x:collection1] o.a.s.u.RandomMergePolicy RandomMergePolicy wrapping class org.apache.lucene.index.LogByteSizeMergePolicy: [LogByteSizeMergePolicy: minMergeSize=1677721, mergeFactor=20, maxMergeSize=2147483648, maxMergeSizeForForcedMerge=9223372036854775807, calibrateSizeByDeletes=false, maxMergeDocs=2147483647, maxCFSSegmentSizeMB=8.796093022207999E12, noCFSRatio=0.13775162729887092] [junit4] 2> 1566315 INFO (coreLoadExecutor-2898-thread-1) [ x:collection1] o.a.s.c.SolrDeletionPolicy SolrDeletionPolicy.onCommit: commits: num=1 [junit4] 2> commit{dir=MockDirectoryWrapper(NRTCachingDirectory(MMapDirectory@/x1/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-6.x/solr/build/solr-core/test/J0/temp/solr.handler.TestReplicationHandler_D1ADDC59DD26247E-001/index-MMapDirectory-001 lockFactory=org.apache.lucene.store.NativeFSLockFactory@4fa89545; maxCacheMB=0.01171875 maxMergeSizeMB=0.2802734375)),segFN=segments_1,generation=1} [junit4] 2> 1566315 INFO (coreLoadExecutor-2898-thread-1) [ x:collection1] o.a.s.c.SolrDeletionPolicy newest commit generation = 1 [junit4] 2> 1566315 INFO (OldIndexDirectoryCleanupThreadForCore-collection1) [ x:collection1] o.a.s.c.SolrCore Looking for old index directories to cleanup for core collection1 in /x1/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-6.x/solr/build/solr-core/test/J0/temp/solr.handler.TestReplicationHandler_D1ADDC59DD26247E-001/solr-instance-001/./collection1/data/ [junit4] 2> 1566317 INFO (coreLoadExecutor-2898-thread-1) [ x:collection1] o.a.s.c.SolrCore no updateRequestProcessorChain defined as default, creating implicit default [junit4] 2> 1566318 INFO (coreLoadExecutor-2898-thread-1) [ x:collection1] o.a.s.h.l.XMLLoader xsltCacheLifetimeSeconds=60 [junit4] 2> 1566319 INFO (coreLoadExecutor-2898-thread-1) [ x:collection1] o.a.s.h.l.XMLLoader xsltCacheLifetimeSeconds=60 [junit4] 2> 1566320 INFO (coreLoadExecutor-2898-thread-1) [ x:collection1] o.a.s.h.l.XMLLoader xsltCacheLifetimeSeconds=60 [junit4] 2> 1566320 INFO (coreLoadExecutor-2898-thread-1) [ x:collection1] o.a.s.h.l.XMLLoader xsltCacheLifetimeSeconds=60 [junit4] 2> 1566321 INFO (coreLoadExecutor-2898-thread-1) [ x:collection1] o.a.s.c.PluginBag requestHandler : 'lazy' created with startup=lazy [junit4] 2> 1566321 INFO (coreLoadExecutor-2898-thread-1) [ x:collection1] o.a.s.c.RequestHandlers Registered paths: /admin/mbeans,standard,lazy,/update/json/docs,/admin/luke,/export,/get,/admin/properties,/update/json,/admin/threads,/update/csv,/sql,/admin/segments,/admin/system,/replication,defaults,/config,/stream,/schema,/admin/plugins,/admin/logging,/admin/ping,/update,/admin/file [junit4] 2> 1566322 INFO (coreLoadExecutor-2898-thread-1) [ x:collection1] o.a.s.c.SolrCore Using default statsCache cache: org.apache.solr.search.stats.LocalStatsCache [junit4] 2> 1566322 INFO (coreLoadExecutor-2898-thread-1) [ x:collection1] o.a.s.u.CommitTracker Hard AutoCommit: disabled [junit4] 2> 1566322 INFO (coreLoadExecutor-2898-thread-1) [ x:collection1] o.a.s.u.CommitTracker Soft AutoCommit: disabled [junit4] 2> 1566322 INFO (coreLoadExecutor-2898-thread-1) [ x:collection1] o.a.s.u.RandomMergePolicy RandomMergePolicy wrapping class org.apache.lucene.index.TieredMergePolicy: [TieredMergePolicy: maxMergeAtOnce=43, maxMergeAtOnceExplicit=20, maxMergedSegmentMB=51.6650390625, floorSegmentMB=1.48046875, forceMergeDeletesPctAllowed=5.072720325122081, segmentsPerTier=34.0, maxCFSSegmentSizeMB=1.53125, noCFSRatio=0.7548887484124109 [junit4] 2> 1566323 INFO (coreLoadExecutor-2898-thread-1) [ x:collection1] o.a.s.c.SolrDeletionPolicy SolrDeletionPolicy.onInit: commits: num=1 [junit4] 2> commit{dir=MockDirectoryWrapper(NRTCachingDirectory(MMapDirectory@/x1/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-6.x/solr/build/solr-core/test/J0/temp/solr.handler.TestReplicationHandler_D1ADDC59DD26247E-001/index-MMapDirectory-001 lockFactory=org.apache.lucene.store.NativeFSLockFactory@4fa89545; maxCacheMB=0.01171875 maxMergeSizeMB=0.2802734375)),segFN=segments_1,generation=1} [junit4] 2> 1566323 INFO (coreLoadExecutor-2898-thread-1) [ x:collection1] o.a.s.c.SolrDeletionPolicy newest commit generation = 1 [junit4] 2> 1566323 INFO (coreLoadExecutor-2898-thread-1) [ x:collection1] o.a.s.s.SolrIndexSearcher Opening [Searcher@2235f147[collection1] main] [junit4] 2> 1566323 INFO (coreLoadExecutor-2898-thread-1) [ x:collection1] o.a.s.r.ManagedResourceStorage File-based storage initialized to use dir: /x1/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-6.x/solr/build/solr-core/test/J0/temp/solr.handler.TestReplicationHandler_D1ADDC59DD26247E-001/solr-instance-001/collection1/conf [junit4] 2> 1566323 INFO (coreLoadExecutor-2898-thread-1) [ x:collection1] o.a.s.r.RestManager Initializing RestManager with initArgs: {storageDir=/x1/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-6.x/solr/build/solr-core/test/J0/temp/solr.handler.TestReplicationHandler_D1ADDC59DD26247E-001/solr-instance-001/collection1/conf} [junit4] 2> 1566323 INFO (coreLoadExecutor-2898-thread-1) [ x:collection1] o.a.s.r.ManagedResourceStorage Reading _rest_managed.json using file:dir=/x1/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-6.x/solr/build/solr-core/test/J0/temp/solr.handler.TestReplicationHandler_D1ADDC59DD26247E-001/solr-instance-001/collection1/conf [junit4] 2> 1566324 INFO (coreLoadExecutor-2898-thread-1) [ x:collection1] o.a.s.r.RestManager Initializing 0 registered ManagedResources [junit4] 2> 1566324 INFO (coreLoadExecutor-2898-thread-1) [ x:collection1] o.a.s.h.ReplicationHandler Replication enabled for following config files: schema.xml,xslt/dummy.xsl [junit4] 2> 1566324 INFO (coreLoadExecutor-2898-thread-1) [ x:collection1] o.a.s.h.ReplicationHandler Commits will be reserved for 10000 [junit4] 2> 1566324 INFO (searcherExecutor-2899-thread-1-processing-x:collection1) [ x:collection1] o.a.s.c.SolrCore [collection1] Registered new searcher Searcher@2235f147[collection1] main{ExitableDirectoryReader(UninvertingDirectoryReader())} [junit4] 2> 1566324 INFO (coreLoadExecutor-2898-thread-1) [ x:collection1] o.a.s.c.CoreContainer registering core: collection1 [junit4] 2> 1566792 INFO (TEST-TestReplicationHandler.testEmptyCommits-seed#[D1ADDC59DD26247E]) [ ] o.a.s.SolrTestCaseJ4 Writing core.properties file to /x1/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-6.x/solr/build/solr-core/test/J0/temp/solr.handler.TestReplicationHandler_D1ADDC59DD26247E-001/solr-instance-002/collection1 [junit4] 2> 1566795 INFO (TEST-TestReplicationHandler.testEmptyCommits-seed#[D1ADDC59DD26247E]) [ ] o.e.j.s.Server jetty-9.3.6.v20151106 [junit4] 2> 1566797 INFO (TEST-TestReplicationHandler.testEmptyCommits-seed#[D1ADDC59DD26247E]) [ ] o.e.j.s.h.ContextHandler Started o.e.j.s.ServletContextHandler@4321f72c{/solr,null,AVAILABLE} [junit4] 2> 1566797 INFO (TEST-TestReplicationHandler.testEmptyCommits-seed#[D1ADDC59DD26247E]) [ ] o.e.j.s.ServerConnector Started ServerConnector@9b13ce4{HTTP/1.1,[http/1.1]}{127.0.0.1:39806} [junit4] 2> 1566797 INFO (TEST-TestReplicationHandler.testEmptyCommits-seed#[D1ADDC59DD26247E]) [ ] o.e.j.s.Server Started @1569769ms [junit4] 2> 1566797 INFO (TEST-TestReplicationHandler.testEmptyCommits-seed#[D1ADDC59DD26247E]) [ ] o.a.s.c.s.e.JettySolrRunner Jetty properties: {solr.data.dir=/x1/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-6.x/solr/build/solr-core/test/J0/temp/solr.handler.TestReplicationHandler_D1ADDC59DD26247E-001/solr-instance-002/collection1/data, hostContext=/solr, hostPort=39806} [junit4] 2> 1566797 INFO (TEST-TestReplicationHandler.testEmptyCommits-seed#[D1ADDC59DD26247E]) [ ] o.a.s.s.SolrDispatchFilter SolrDispatchFilter.init(): sun.misc.Launcher$AppClassLoader@4e0e2f2a [junit4] 2> 1566798 INFO (TEST-TestReplicationHandler.testEmptyCommits-seed#[D1ADDC59DD26247E]) [ ] o.a.s.c.SolrResourceLoader new SolrResourceLoader for directory: '/x1/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-6.x/solr/build/solr-core/test/J0/temp/solr.handler.TestReplicationHandler_D1ADDC59DD26247E-001/solr-instance-002' [junit4] 2> 1566798 INFO (TEST-TestReplicationHandler.testEmptyCommits-seed#[D1ADDC59DD26247E]) [ ] o.a.s.c.SolrResourceLoader JNDI not configured for solr (NoInitialContextEx) [junit4] 2> 1566798 INFO (TEST-TestReplicationHandler.testEmptyCommits-seed#[D1ADDC59DD26247E]) [ ] o.a.s.c.SolrResourceLoader solr home defaulted to 'solr/' (could not find system property or JNDI) [junit4] 2> 1566798 INFO (TEST-TestReplicationHandler.testEmptyCommits-seed#[D1ADDC59DD26247E]) [ ] o.a.s.c.SolrXmlConfig Loading container configuration from /x1/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-6.x/solr/build/solr-core/test/J0/temp/solr.handler.TestReplicationHandler_D1ADDC59DD26247E-001/solr-instance-002/solr.xml [junit4] 2> 1566802 INFO (TEST-TestReplicationHandler.testEmptyCommits-seed#[D1ADDC59DD26247E]) [ ] o.a.s.c.CorePropertiesLocator Config-defined core root directory: /x1/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-6.x/solr/build/solr-core/test/J0/temp/solr.handler.TestReplicationHandler_D1ADDC59DD26247E-001/solr-instance-002/. [junit4] 2> 1566802 INFO (TEST-TestReplicationHandler.testEmptyCommits-seed#[D1ADDC59DD26247E]) [ ] o.a.s.c.CoreContainer New CoreContainer 396513284 [junit4] 2> 1566802 INFO (TEST-TestReplicationHandler.testEmptyCommits-seed#[D1ADDC59DD26247E]) [ ] o.a.s.c.CoreContainer Loading cores into CoreContainer [instanceDir=/x1/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-6.x/solr/build/solr-core/test/J0/temp/solr.handler.TestReplicationHandler_D1ADDC59DD26247E-001/solr-instance-002] [junit4] 2> 1566803 WARN (TEST-TestReplicationHandler.testEmptyCommits-seed#[D1ADDC59DD26247E]) [ ] o.a.s.c.CoreContainer Couldn't add files from /x1/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-6.x/solr/build/solr-core/test/J0/temp/solr.handler.TestReplicationHandler_D1ADDC59DD26247E-001/solr-instance-002/lib to classpath: /x1/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-6.x/solr/build/solr-core/test/J0/temp/solr.handler.TestReplicationHandler_D1ADDC59DD26247E-001/solr-instance-002/lib [junit4] 2> 1566803 INFO (TEST-TestReplicationHandler.testEmptyCommits-seed#[D1ADDC59DD26247E]) [ ] o.a.s.h.c.HttpShardHandlerFactory created with socketTimeout : 90000,urlScheme : ,connTimeout : 15000,maxConnectionsPerHost : 20,maxConnections : 10000,corePoolSize : 0,maximumPoolSize : 2147483647,maxThreadIdleTime : 5,sizeOfQueue : -1,fairnessPolicy : false,useRetries : false, [junit4] 2> 1566804 INFO (TEST-TestReplicationHandler.testEmptyCommits-seed#[D1ADDC59DD26247E]) [ ] o.a.s.u.UpdateShardHandler Creating UpdateShardHandler HTTP client with params: socketTimeout=340000&connTimeout=45000&retry=true [junit4] 2> 1566805 INFO (TEST-TestReplicationHandler.testEmptyCommits-seed#[D1ADDC59DD26247E]) [ ] o.a.s.l.LogWatcher SLF4J impl is org.slf4j.impl.Log4jLoggerFactory [junit4] 2> 1566805 INFO (TEST-TestReplicationHandler.testEmptyCommits-seed#[D1ADDC59DD26247E]) [ ] o.a.s.l.LogWatcher Registering Log Listener [Log4j (org.slf4j.impl.Log4jLoggerFactory)] [junit4] 2> 1566805 INFO (TEST-TestReplicationHandler.testEmptyCommits-seed#[D1ADDC59DD26247E]) [ ] o.a.s.c.CoreContainer Security conf doesn't exist. Skipping setup for authorization module. [junit4] 2> 1566805 INFO (TEST-TestReplicationHandler.testEmptyCommits-seed#[D1ADDC59DD26247E]) [ ] o.a.s.c.CoreContainer No authentication plugin used. [junit4] 2> 1566805 INFO (TEST-TestReplicationHandler.testEmptyCommits-seed#[D1ADDC59DD26247E]) [ ] o.a.s.c.CorePropertiesLocator Looking for core definitions underneath /x1/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-6.x/solr/build/solr-core/test/J0/temp/solr.handler.TestReplicationHandler_D1ADDC59DD26247E-001/solr-instance-002/. [junit4] 2> 1566806 INFO (TEST-TestReplicationHandler.testEmptyCommits-seed#[D1ADDC59DD26247E]) [ ] o.a.s.c.CoreDescriptor Created CoreDescriptor: {name=collection1, config=solrconfig.xml, loadOnStartup=true, schema=schema.xml, configSetProperties=configsetprops.json, transient=false, dataDir=data/} [junit4] 2> 1566806 INFO (TEST-TestReplicationHandler.testEmptyCommits-seed#[D1ADDC59DD26247E]) [ ] o.a.s.c.CorePropertiesLocator Found core collection1 in /x1/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-6.x/solr/build/solr-core/test/J0/temp/solr.handler.TestReplicationHandler_D1ADDC59DD26247E-001/solr-instance-002/./collection1 [junit4] 2> 1566806 INFO (TEST-TestReplicationHandler.testEmptyCommits-seed#[D1ADDC59DD26247E]) [ ] o.a.s.c.CorePropertiesLocator Found 1 core definitions [junit4] 2> 1566807 INFO (coreLoadExecutor-2908-thread-1) [ ] o.a.s.c.SolrResourceLoader new SolrResourceLoader for directory: '/x1/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-6.x/solr/build/solr-core/test/J0/temp/solr.handler.TestReplicationHandler_D1ADDC59DD26247E-001/solr-instance-002/collection1' [junit4] 2> 1566810 INFO (TEST-TestReplicationHandler.testEmptyCommits-seed#[D1ADDC59DD26247E]) [ ] o.a.s.s.SolrDispatchFilter user.dir=/x1/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-6.x/solr/build/solr-core/test/J0 [junit4] 2> 1566811 INFO (TEST-TestReplicationHandler.testEmptyCommits-seed#[D1ADDC59DD26247E]) [ ] o.a.s.s.SolrDispatchFilter SolrDispatchFilter.init() done [junit4] 2> 1566811 INFO (coreLoadExecutor-2908-thread-1) [ ] o.a.s.c.SolrResourceLoader JNDI not configured for solr (NoInitialContextEx) [junit4] 2> 1566811 INFO (coreLoadExecutor-2908-thread-1) [ ] o.a.s.c.SolrResourceLoader solr home defaulted to 'solr/' (could not find system property or JNDI) [junit4] 2> 1566817 INFO (coreLoadExecutor-2908-thread-1) [ ] o.a.s.c.SolrConfig current version of requestparams : -1 [junit4] 2> 1566820 INFO (coreLoadExecutor-2908-thread-1) [ ] o.a.s.c.SolrConfig Using Lucene MatchVersion: 6.1.0 [junit4] 2> 1566825 INFO (coreLoadExecutor-2908-thread-1) [ ] o.a.s.c.SolrConfig Loaded SolrConfig: solrconfig.xml [junit4] 2> 1566828 INFO (coreLoadExecutor-2908-thread-1) [ ] o.a.s.s.IndexSchema [collection1] Schema name=test [junit4] 2> 1566843 INFO (coreLoadExecutor-2908-thread-1) [ ] o.a.s.s.IndexSchema unique key field: id [junit4] 2> 1566844 INFO (coreLoadExecutor-2908-thread-1) [ ] o.a.s.c.ConfigSetProperties Did not find ConfigSet properties, assuming default properties: Can't find resource 'configsetprops.json' in classpath or '/x1/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-6.x/solr/build/solr-core/test/J0/temp/solr.handler.TestReplicationHandler_D1ADDC59DD26247E-001/solr-instance-002/collection1' [junit4] 2> 1566844 INFO (coreLoadExecutor-2908-thread-1) [ ] o.a.s.c.CoreContainer Creating SolrCore 'collection1' using configuration from instancedir /x1/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-6.x/solr/build/solr-core/test/J0/temp/solr.handler.TestReplicationHandler_D1ADDC59DD26247E-001/solr-instance-002/./collection1 [junit4] 2> 1566844 INFO (coreLoadExecutor-2908-thread-1) [ x:collection1] o.a.s.c.SolrCore org.apache.solr.core.MockDirectoryFactory [junit4] 2> 1566844 INFO (coreLoadExecutor-2908-thread-1) [ x:collection1] o.a.s.c.SolrCore [[collection1] ] Opening new SolrCore at [/x1/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-6.x/solr/build/solr-core/test/J0/temp/solr.handler.TestReplicationHandler_D1ADDC59DD26247E-001/solr-instance-002/collection1], dataDir=[/x1/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-6.x/solr/build/solr-core/test/J0/temp/solr.handler.TestReplicationHandler_D1ADDC59DD26247E-001/solr-instance-002/./collection1/data/] [junit4] 2> 1566844 INFO (coreLoadExecutor-2908-thread-1) [ x:collection1] o.a.s.c.SolrCore JMX monitoring not detected for core: collection1 [junit4] 2> 1566845 INFO (coreLoadExecutor-2908-thread-1) [ x:collection1] o.a.s.c.CachingDirectoryFactory return new directory for /x1/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-6.x/solr/build/solr-core/test/J0/temp/solr.handler.TestReplicationHandler_D1ADDC59DD26247E-001/solr-instance-002/./collection1/data [junit4] 2> 1566845 INFO (coreLoadExecutor-2908-thread-1) [ x:collection1] o.a.s.c.SolrCore New index directory detected: old=null new=/x1/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-6.x/solr/build/solr-core/test/J0/temp/solr.handler.TestReplicationHandler_D1ADDC59DD26247E-001/solr-instance-002/./collection1/data/index/ [junit4] 2> 1566845 WARN (coreLoadExecutor-2908-thread-1) [ x:collection1] o.a.s.c.SolrCore [collection1] Solr index directory '/x1/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-6.x/solr/build/solr-core/test/J0/temp/solr.handler.TestReplicationHandler_D1ADDC59DD26247E-001/solr-instance-002/./collection1/data/index' doesn't exist. Creating new index... [junit4] 2> 1566846 INFO (coreLoadExecutor-2908-thread-1) [ x:collection1] o.a.s.c.CachingDirectoryFactory return new directory for /x1/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-6.x/solr/build/solr-core/test/J0/temp/solr.handler.TestReplicationHandler_D1ADDC59DD26247E-001/solr-instance-002/./collection1/data/index [junit4] 2> 1566846 INFO (coreLoadExecutor-2908-thread-1) [ x:collection1] o.a.s.u.RandomMergePolicy RandomMergePolicy wrapping class org.apache.lucene.index.LogByteSizeMergePolicy: [LogByteSizeMergePolicy: minMergeSize=1677721, mergeFactor=20, maxMergeSize=2147483648, maxMergeSizeForForcedMerge=9223372036854775807, calibrateSizeByDeletes=false, maxMergeDocs=2147483647, maxCFSSegmentSizeMB=8.796093022207999E12, noCFSRatio=0.13775162729887092] [junit4] 2> 1566848 INFO (coreLoadExecutor-2908-thread-1) [ x:collection1] o.a.s.c.SolrDeletionPolicy SolrDeletionPolicy.onCommit: commits: num=1 [junit4] 2> commit{dir=MockDirectoryWrapper(NRTCachingDirectory(MMapDirectory@/x1/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-6.x/solr/build/solr-core/test/J0/temp/solr.handler.TestReplicationHandler_D1ADDC59DD26247E-001/index-MMapDirectory-002 lockFactory=org.apache.lucene.store.NativeFSLockFactory@4fa89545; maxCacheMB=0.01171875 maxMergeSizeMB=0.2802734375)),segFN=segments_1,generation=1} [junit4] 2> 1566848 INFO (coreLoadExecutor-2908-thread-1) [ x:collection1] o.a.s.c.SolrDeletionPolicy newest commit generation = 1 [junit4] 2> 1566848 INFO (OldIndexDirectoryCleanupThreadForCore-collection1) [ x:collection1] o.a.s.c.SolrCore Looking for old index directories to cleanup for core collection1 in /x1/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-6.x/solr/build/solr-core/test/J0/temp/solr.handler.TestReplicationHandler_D1ADDC59DD26247E-001/solr-instance-002/./collection1/data/ [junit4] 2> 1566850 INFO (coreLoadExecutor-2908-thread-1) [ x:collection1] o.a.s.c.SolrCore no updateRequestProcessorChain defined as default, creating implicit default [junit4] 2> 1566851 INFO (coreLoadExecutor-2908-thread-1) [ x:collection1] o.a.s.h.l.XMLLoader xsltCacheLifetimeSeconds=60 [junit4] 2> 1566852 INFO (coreLoadExecutor-2908-thread-1) [ x:collection1] o.a.s.h.l.XMLLoader xsltCacheLifetimeSeconds=60 [junit4] 2> 1566853 INFO (coreLoadExecutor-2908-thread-1) [ x:collection1] o.a.s.h.l.XMLLoader xsltCacheLifetimeSeconds=60 [junit4] 2> 1566853 INFO (coreLoadExecutor-2908-thread-1) [ x:collection1] o.a.s.h.l.XMLLoader xsltCacheLifetimeSeconds=60 [junit4] 2> 1566854 INFO (coreLoadExecutor-2908-thread-1) [ x:collection1] o.a.s.c.PluginBag requestHandler : 'lazy' created with startup=lazy [junit4] 2> 1566854 INFO (coreLoadExecutor-2908-thread-1) [ x:collection1] o.a.s.c.RequestHandlers Registered paths: /admin/mbeans,standard,lazy,/update/json/docs,/admin/luke,/export,/get,/admin/properties,/update/json,/admin/threads,/update/csv,/sql,/admin/segments,/admin/system,/replication,defaults,/config,/stream,/schema,/admin/plugins,/admin/logging,/admin/ping,/update,/admin/file [junit4] 2> 1566855 INFO (coreLoadExecutor-2908-thread-1) [ x:collection1] o.a.s.c.SolrCore Using default statsCache cache: org.apache.solr.search.stats.LocalStatsCache [junit4] 2> 1566855 INFO (coreLoadExecutor-2908-thread-1) [ x:collection1] o.a.s.u.CommitTracker Hard AutoCommit: disabled [junit4] 2> 1566855 INFO (coreLoadExecutor-2908-thread-1) [ x:collection1] o.a.s.u.CommitTracker Soft AutoCommit: disabled [junit4] 2> 1566855 INFO (coreLoadExecutor-2908-thread-1) [ x:collection1] o.a.s.u.RandomMergePolicy RandomMergePolicy wrapping class org.apache.lucene.index.TieredMergePolicy: [TieredMergePolicy: maxMergeAtOnce=43, maxMergeAtOnceExplicit=20, maxMergedSegmentMB=51.6650390625, floorSegmentMB=1.48046875, forceMergeDeletesPctAllowed=5.072720325122081, segmentsPerTier=34.0, maxCFSSegmentSizeMB=1.53125, noCFSRatio=0.7548887484124109 [junit4] 2> 1566856 INFO (coreLoadExecutor-2908-thread-1) [ x:collection1] o.a.s.c.SolrDeletionPolicy SolrDeletionPolicy.onInit: commits: num=1 [junit4] 2> commit{dir=MockDirectoryWrapper(NRTCachingDirectory(MMapDirectory@/x1/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-6.x/solr/build/solr-core/test/J0/temp/solr.handler.TestReplicationHandler_D1ADDC59DD26247E-001/index-MMapDirectory-002 lockFactory=org.apache.lucene.store.NativeFSLockFactory@4fa89545; maxCacheMB=0.01171875 maxMergeSizeMB=0.2802734375)),segFN=segments_1,generation=1} [junit4] 2> 1566856 INFO (coreLoadExecutor-2908-thread-1) [ x:collection1] o.a.s.c.SolrDeletionPolicy newest commit generation = 1 [junit4] 2> 1566856 INFO (coreLoadExecutor-2908-thread-1) [ x:collection1] o.a.s.s.SolrIndexSearcher Opening [Searcher@3b7079cd[collection1] main] [junit4] 2> 1566856 INFO (coreLoadExecutor-2908-thread-1) [ x:collection1] o.a.s.r.ManagedResourceStorage File-based storage initialized to use dir: /x1/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-6.x/solr/build/solr-core/test/J0/temp/solr.handler.TestReplicationHandler_D1ADDC59DD26247E-001/solr-instance-002/collection1/conf [junit4] 2> 1566856 INFO (coreLoadExecutor-2908-thread-1) [ x:collection1] o.a.s.r.RestManager Initializing RestManager with initArgs: {storageDir=/x1/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-6.x/solr/build/solr-core/test/J0/temp/solr.handler.TestReplicationHandler_D1ADDC59DD26247E-001/solr-instance-002/collection1/conf} [junit4] 2> 1566856 INFO (coreLoadExecutor-2908-thread-1) [ x:collection1] o.a.s.r.ManagedResourceStorage Reading _rest_managed.json using file:dir=/x1/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-6.x/solr/build/solr-core/test/J0/temp/solr.handler.TestReplicationHandler_D1ADDC59DD26247E-001/solr-instance-002/collection1/conf [junit4] 2> 1566857 INFO (coreLoadExecutor-2908-thread-1) [ x:collection1] o.a.s.r.RestManager Initializing 0 registered ManagedResources [junit4] 2> 1566886 INFO (coreLoadExecutor-2908-thread-1) [ x:collection1] o.a.s.h.ReplicationHandler Poll scheduled at an interval of 1000ms [junit4] 2> 1566887 INFO (searcherExecutor-2909-thread-1-processing-x:collection1) [ x:collection1] o.a.s.c.SolrCore [collection1] Registered new searcher Searcher@3b7079cd[collection1] main{ExitableDirectoryReader(UninvertingDirectoryReader())} [junit4] 2> 1566892 INFO (coreLoadExecutor-2908-thread-1) [ x:collection1] o.a.s.c.CoreContainer registering core: collection1 [junit4] 2> 1566893 INFO (qtp1998444025-70254) [ x:collection1] o.a.s.c.S.Request [collection1] webapp=/solr path=/replication params={qt=/replication&wt=javabin&version=2&command=indexversion} status=0 QTime=0 [junit4] 2> 1567313 INFO (qtp1998444025-70252) [ x:collection1] o.a.s.c.S.Request [collection1] webapp=/solr path=/select params={q=*:*&sort=id+desc&wt=javabin&version=2} hits=0 status=0 QTime=0 [junit4] 2> 1567317 INFO (qtp1998444025-70252) [ x:collection1] o.a.s.u.p.LogUpdateProcessorFactory [collection1] webapp=/solr path=/update params={wt=javabin&version=2}{add=[1]} 0 1 [junit4] 2> 1567319 INFO (qtp1998444025-70257) [ x:collection1] o.a.s.u.DirectUpdateHandler2 start commit{,optimize=false,openSearcher=true,waitSearcher=true,expungeDeletes=false,softCommit=false,prepareCommit=false} [junit4] 2> 1567324 INFO (qtp1998444025-70257) [ x:collection1] o.a.s.c.SolrDeletionPolicy SolrDeletionPolicy.onCommit: commits: num=2 [junit4] 2> commit{dir=MockDirectoryWrapper(NRTCachingDirectory(MMapDirectory@/x1/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-6.x/solr/build/solr-core/test/J0/temp/solr.handler.TestReplicationHandler_D1ADDC59DD26247E-001/index-MMapDirectory-001 lockFactory=org.apache.lucene.store.NativeFSLockFactory@4fa89545; maxCacheMB=0.01171875 maxMergeSizeMB=0.2802734375)),segFN=segments_1,generation=1} [junit4] 2> commit{dir=MockDirectoryWrapper(NRTCachingDirectory(MMapDirectory@/x1/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-6.x/solr/build/solr-core/test/J0/temp/solr.handler.TestReplicationHandler_D1ADDC59DD26247E-001/index-MMapDirectory-001 lockFactory=org.apache.lucene.store.NativeFSLockFactory@4fa89545; maxCacheMB=0.01171875 maxMergeSizeMB=0.2802734375)),segFN=segments_2,generation=2} [junit4] 2> 1567325 INFO (qtp1998444025-70257) [ x:collection1] o.a.s.c.SolrDeletionPolicy newest commit generation = 2 [junit4] 2> 1567328 INFO (qtp1998444025-70257) [ x:collection1] o.a.s.s.SolrIndexSearcher Opening [Searcher@7fcff631[collection1] main] [junit4] 2> 1567328 INFO (qtp1998444025-70257) [ x:collection1] o.a.s.u.DirectUpdateHandler2 end_commit_flush [junit4] 2> 1567328 INFO (searcherExecutor-2899-thread-1-processing-x:collection1) [ x:collection1] o.a.s.c.SolrCore [collection1] Registered new searcher Searcher@7fcff631[collection1] main{ExitableDirectoryReader(UninvertingDirectoryReader(Uninverting(_0(6.1.0):C1)))} [junit4] 2> 1567330 INFO (qtp1998444025-70257) [ x:collection1] o.a.s.u.p.LogUpdateProcessorFactory [collection1] webapp=/solr path=/update params={commit=true&wt=javabin&version=2}{commit=} 0 11 [junit4] 2> 1567343 WARN (explicit-fetchindex-cmd) [ x:collection1] o.a.s.h.IndexFetcher 'masterUrl' must be specified without the /replication suffix [junit4] 2> 1567347 INFO (qtp1998444025-70254) [ x:collection1] o.a.s.c.S.Request [collection1] webapp=/solr path=/replication params={qt=/replication&wt=javabin&version=2&command=indexversion} status=0 QTime=0 [junit4] 2> 1567347 INFO (explicit-fetchindex-cmd) [ x:collection1] o.a.s.h.IndexFetcher Master's generation: 2 [junit4] 2> 1567347 INFO (explicit-fetchindex-cmd) [ x:collection1] o.a.s.h.IndexFetcher Slave's generation: 1 [junit4] 2> 1567347 INFO (explicit-fetchindex-cmd) [ x:collection1] o.a.s.h.IndexFetcher Starting replication process [junit4] 2> 1567353 INFO (qtp1998444025-70254) [ x:collection1] o.a.s.c.S.Request [collection1] webapp=/solr path=/replication params={generation=2&qt=/replication&wt=javabin&version=2&command=filelist} status=0 QTime=4 [junit4] 2> 1567354 INFO (explicit-fetchindex-cmd) [ x:collection1] o.a.s.h.IndexFetcher Number of files in latest index in master: 10 [junit4] 2> 1567359 INFO (explicit-fetchindex-cmd) [ x:collection1] o.a.s.c.CachingDirectoryFactory return new directory for /x1/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-6.x/solr/build/solr-core/test/J0/temp/solr.handler.TestReplicationHandler_D1ADDC59DD26247E-001/solr-instance-002/./collection1/data/index.20160309024601632 [junit4] 2> 1567377 INFO (explicit-fetchindex-cmd) [ x:collection1] o.a.s.u.DefaultSolrCoreState Rollback old IndexWriter... core=collection1 [junit4] 2> 1567377 INFO (explicit-fetchindex-cmd) [ x:collection1] o.a.s.u.RandomMergePolicy RandomMergePolicy wrapping class org.apache.lucene.index.MockRandomMergePolicy: org.apache.lucene.index.MockRandomMergePolicy@53686783 [junit4] 2> 1567379 INFO (explicit-fetchindex-cmd) [ x:collection1] o.a.s.c.SolrDeletionPolicy SolrDeletionPolicy.onInit: commits: num=1 [junit4] 2> commit{dir=MockDirectoryWrapper(NRTCachingDirectory(MMapDirectory@/x1/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-6.x/solr/build/solr-core/test/J0/temp/solr.handler.TestReplicationHandler_D1ADDC59DD26247E-001/index-MMapDirectory-002 lockFactory=org.apache.lucene.store.NativeFSLockFactory@4fa89545; maxCacheMB=0.01171875 maxMergeSizeMB=0.2802734375)),segFN=segments_1,generation=1} [junit4] 2> 1567380 INFO (explicit-fetchindex-cmd) [ x:collection1] o.a.s.c.SolrDeletionPolicy newest commit generation = 1 [junit4] 2> 1567380 INFO (explicit-fetchindex-cmd) [ x:collection1] o.a.s.u.DefaultSolrCoreState New IndexWriter is ready to be used. [junit4] 2> 1567381 INFO (explicit-fetchindex-cmd) [ x:collection1] o.a.s.c.SolrDeletionPolicy SolrDeletionPolicy.onCommit: commits: num=1 [junit4] 2> commit{dir=MockDirectoryWrapper(NRTCachingDirectory(MMapDirectory@/x1/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-6.x/solr/build/solr-core/test/J0/temp/solr.handler.TestReplicationHandler_D1ADDC59DD26247E-001/index-MMapDirectory-002 lockFactory=org.apache.lucene.store.NativeFSLockFactory@4fa89545; maxCacheMB=0.01171875 maxMergeSizeMB=0.2802734375)),segFN=segments_1,generation=1} [junit4] 2> 1567381 INFO (explicit-fetchindex-cmd) [ x:collection1] o.a.s.c.SolrDeletionPolicy newest commit generation = 1 [junit4] 2> 1567381 INFO (explicit-fetchindex-cmd) [ x:collection1] o.a.s.u.DefaultSolrCoreState Rollback old IndexWriter... core=collection1 [junit4] 2> 1567381 INFO (explicit-fetchindex-cmd) [ x:collection1] o.a.s.h.IndexFetcher Starting download (fullCopy=false) to MockDirectoryWrapper(SimpleFSDirectory@/x1/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-6.x/solr/build/solr-core/test/J0/temp/solr.handler.TestReplicationHandler_D1ADDC59DD26247E-001/index-SimpleFSDirectory-003 lockFactory=org.apache.lucene.store.NativeFSLockFactory@4fa89545) [junit4] 2> 1567384 INFO (qtp1998444025-70255) [ x:collection1] o.a.s.c.S.Request [collection1] webapp=/solr path=/replication params={generation=2&qt=/replication&file=_0.si&checksum=true&wt=filestream&command=filecontent} status=0 QTime=0 [junit4] 2> 1567397 INFO (qtp1998444025-70255) [ x:collection1] o.a.s.c.S.Request [collection1] webapp=/solr path=/replication params={generation=2&qt=/replication&file=_0.nvd&checksum=true&wt=filestream&command=filecontent} status=0 QTime=0 [junit4] 2> 1567399 INFO (qtp1998444025-70252) [ x:collection1] o.a.s.c.S.Request [collection1] webapp=/solr path=/replication params={generation=2&qt=/replication&file=_0.tip&checksum=true&wt=filestream&command=filecontent} status=0 QTime=0 [junit4] 2> 1567403 INFO (qtp1998444025-70257) [ x:collection1] o.a.s.c.S.Request [collection1] webapp=/solr path=/replication params={generation=2&qt=/replication&file=_0.fdx&checksum=true&wt=filestream&command=filecontent} status=0 QTime=0 [junit4] 2> 1567406 INFO (qtp1998444025-70251) [ x:collection1] o.a.s.c.S.Request [collection1] webapp=/solr path=/replication params={generation=2&qt=/replication&file=_0.doc&checksum=true&wt=filestream&command=filecontent} status=0 QTime=0 [junit4] 2> 1567408 INFO (qtp1998444025-70254) [ x:collection1] o.a.s.c.S.Request [collection1] webapp=/solr path=/replication params={generation=2&qt=/replication&file=_0.tim&checksum=true&wt=filestream&command=filecontent} status=0 QTime=0 [junit4] 2> 1567411 INFO (qtp1998444025-70256) [ x:collection1] o.a.s.c.S.Request [collection1] webapp=/solr path=/replication params={generation=2&qt=/replication&file=_0.fdt&checksum=true&wt=filestream&command=filecontent} status=0 QTime=0 [junit4] 2> 1567414 INFO (qtp1998444025-70255) [ x:collection1] o.a.s.c.S.Request [collection1] webapp=/solr path=/replication params={generation=2&qt=/replication&file=_0.fnm&checksum=true&wt=filestream&command=filecontent} status=0 QTime=0 [junit4] 2> 1567417 INFO (qtp1998444025-70252) [ x:collection1] o.a.s.c.S.Request [collection1] webapp=/solr path=/replication params={generation=2&qt=/replication&file=_0.nvm&checksum=true&wt=filestream&command=filecontent} status=0 QTime=0 [junit4] 2> 1567420 INFO (qtp1998444025-70257) [ x:collection1] o.a.s.c.S.Request [collection1] webapp=/solr path=/replication params={generation=2&qt=/replication&file=segments_2&checksum=true&wt=filestream&command=filecontent} status=0 QTime=0 [junit4] 2> 1567421 INFO (explicit-fetchindex-cmd) [ x:collection1] o.a.s.h.IndexFetcher Total time taken for download (fullCopy=false,bytesDownloaded=1408) : 0 secs (null bytes/sec) to MockDirectoryWrapper(SimpleFSDirectory@/x1/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-6.x/solr/build/solr-core/test/J0/temp/solr.handler.TestReplicationHandler_D1ADDC59DD26247E-001/index-SimpleFSDirectory-003 lockFactory=org.apache.lucene.store.NativeFSLockFactory@4fa89545) [junit4] 2> 1567435 INFO (explicit-fetchindex-cmd) [ x:collection1] o.a.s.u.RandomMergePolicy RandomMergePolicy wrapping class org.apache.lucene.index.MockRandomMergePolicy: org.apache.lucene.index.MockRandomMergePolicy@2daa7550 [junit4] 2> 1567436 INFO (explicit-fetchindex-cmd) [ x:collection1] o.a.s.c.SolrDeletionPolicy SolrDeletionPolicy.onInit: commits: num=2 [junit4] 2> commit{dir=MockDirectoryWrapper(NRTCachingDirectory(MMapDirectory@/x1/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-6.x/solr/build/solr-core/test/J0/temp/solr.handler.TestReplicationHandler_D1ADDC59DD26247E-001/index-MMapDirectory-002 lockFactory=org.apache.lucene.store.NativeFSLockFactory@4fa89545; maxCacheMB=0.01171875 maxMergeSizeMB=0.2802734375)),segFN=segments_1,generation=1} [junit4] 2> commit{dir=MockDirectoryWrapper(NRTCachingDirectory(MMapDirectory@/x1/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-6.x/solr/build/solr-core/test/J0/temp/solr.handler.TestReplicationHandler_D1ADDC59DD26247E-001/index-MMapDirectory-002 lockFactory=org.apache.lucene.store.NativeFSLockFactory@4fa89545; maxCacheMB=0.01171875 maxMergeSizeMB=0.2802734375)),segFN=segments_2,generation=2} [junit4] 2> 1567436 INFO (explicit-fetchindex-cmd) [ x:collection1] o.a.s.c.SolrDeletionPolicy newest commit generation = 2 [junit4] 2> 1567441 INFO (explicit-fetchindex-cmd) [ x:collection1] o.a.s.u.DefaultSolrCoreState New IndexWriter is ready to be used. [junit4] 2> 1567442 INFO (explicit-fetchindex-cmd) [ x:collection1] o.a.s.s.SolrIndexSearcher Opening [Searcher@24975a47[collection1] main] [junit4] 2> 1567443 INFO (searcherExecutor-2909-thread-1-processing-x:collection1) [ x:collection1] o.a.s.c.SolrCore [collection1] Registered new searcher Searcher@24975a47[collection1] main{ExitableDirectoryReader(UninvertingDirectoryReader(Uninverting(_0(6.1.0):C1)))} [junit4] 2> 1567443 INFO (explicit-fetchindex-cmd) [ x:collection1] o.a.s.c.CachingDirectoryFactory looking to close /x1/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-6.x/solr/build/solr-core/test/J0/temp/solr.handler.TestReplicationHandler_D1ADDC59DD26247E-001/solr-instance-002/./collection1/data/index.20160309024601632 [CachedDir<<refCount=0;path=/x1/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-6.x/solr/build/solr-core/test/J0/temp/solr.handler.TestReplicationHandler_D1ADDC59DD26247E-001/solr-instance-002/./collection1/data/index.20160309024601632;done=true>>] [junit4] 2> 1567443 INFO (explicit-fetchindex-cmd) [ x:collection1] o.a.s.c.CachingDirectoryFactory Closing directory: /x1/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-6.x/solr/build/solr-core/test/J0/temp/solr.handler.TestReplicationHandler_D1ADDC59DD26247E-001/solr-instance-002/./collection1/data/index.20160309024601632 [junit4] 2> 1567446 INFO (qtp1931771852-70273) [ x:collection1] o.a.s.c.S.Request [collection1] webapp=/solr path=/replication params={wait=true&masterUrl=http://127.0.0.1:54644/solr/collection1/replication&command=fetchindex} status=0 QTime=103 [junit4] 2> 1567453 INFO (qtp1931771852-70275) [ x:collection1] o.a.s.c.S.Request [collection1] webapp=/solr path=/select params={q=name:empty1&sort=id+desc&wt=javabin&version=2} hits=1 status=0 QTime=0 [junit4] 2> 1567454 INFO (TEST-TestReplicationHandler.testEmptyCommits-seed#[D1ADDC59DD26247E]) [ ] o.a.s.h.TestReplicationHandler Waited for 0ms and found 1 docs [junit4] 2> 1567456 INFO (qtp1998444025-70258) [ x:collection1] o.a.s.c.S.Request [collection1] webapp=/solr path=/replication params={_trace=getDetails&qt=/replication&wt=javabin&version=2&command=details} status=0 QTime=0 [junit4] 2> 1567468 INFO (qtp1998444025-70254) [ x:collection1] o.a.s.c.S.Request [collection1] webapp=/solr path=/replication params={_trace=getDetails&qt=/replication&wt=javabin&version=2&command=details} status=0 QTime=1 [junit4] 2> 1567473 INFO (qtp1998444025-70251) [ x:collection1] o.a.s.c.S.Request [collection1] webapp=/solr path=/replication params={slave=false&qt=/replication&wt=javabin&version=2&command=details} status=0 QTime=0 [junit4] 2> 1567474 INFO (qtp1931771852-70275) [ x:collection1] o.a.s.c.S.Request [collection1] webapp=/solr path=/replication params={_trace=getDetails&qt=/replication&wt=javabin&version=2&command=details} status=0 QTime=4 [junit4] 2> 1567475 INFO (qtp1998444025-70256) [ x:collection1] o.a.s.c.S.Request [collection1] webapp=/solr path=/replication params={_trace=assertVersions&qt=/replication&wt=javabin&version=2&command=indexversion} status=0 QTime=0 [junit4] 2> 1567480 INFO (qtp1931771852-70274) [ x:collection1] o.a.s.c.S.Request [collection1] webapp=/solr path=/replication params={_trace=assertVersions&qt=/replication&wt=javabin&version=2&command=indexversion} status=0 QTime=0 [junit4] 2> 1567482 INFO (qtp1998444025-70252) [ x:collection1] o.a.s.u.DirectUpdateHandler2 start commit{,optimize=false,openSearcher=true,waitSearcher=true,expungeDeletes=false,softCommit=false,prepareCommit=false} [junit4] 2> 1567482 INFO (qtp1998444025-70252) [ x:collection1] o.a.s.u.DirectUpdateHandler2 No uncommitted changes. Skipping IW.commit. [junit4] 2> 1567482 INFO (qtp1998444025-70252) [ x:collection1] o.a.s.c.SolrCore SolrIndexSearcher has not changed - not re-opening: org.apache.solr.search.SolrIndexSearcher [junit4] 2> 1567482 INFO (qtp1998444025-70252) [ x:collection1] o.a.s.u.DirectUpdateHandler2 end_commit_flush [junit4] 2> 1567482 INFO (qtp1998444025-70252) [ x:collection1] o.a.s.u.p.LogUpdateProcessorFactory [collection1] webapp=/solr path=/update params={commit=true&wt=javabin&version=2}{commit=} 0 0 [junit4] 2> 1567491 WARN (explicit-fetchindex-cmd) [ x:collection1] o.a.s.h.IndexFetcher 'masterUrl' must be specified without the /replication suffix [junit4] 2> 1567495 INFO (qtp1998444025-70255) [ x:collection1] o.a.s.c.S.Request [collection1] webapp=/solr path=/replication params={qt=/replication&wt=javabin&version=2&command=indexversion} status=0 QTime=0 [junit4] 2> 1567496 INFO (explicit-fetchindex-cmd) [ x:collection1] o.a.s.h.IndexFetcher Slave in sync with master. [junit4] 2> 1567497 INFO (qtp1931771852-70272) [ x:collection1] o.a.s.c.S.Request [collection1] webapp=/solr path=/replication params={wait=true&masterUrl=http://127.0.0.1:54644/solr/collection1/replication&command=fetchindex} status=0 QTime=13 [junit4] 2> 1567501 INFO (qtp1998444025-70257) [ x:collection1] o.a.s.u.p.LogUpdateProcessorFactory [collection1] webapp=/solr path=/update params={wt=javabin&version=2}{add=[2]} 0 2 [junit4] 2> 1567503 INFO (qtp1998444025-70254) [ x:collection1] o.a.s.u.DirectUpdateHandler2 start commit{,optimize=false,openSearcher=true,waitSearcher=true,expungeDeletes=false,softCommit=false,prepareCommit=false} [junit4] 2> 1567522 INFO (qtp1998444025-70254) [ x:collection1] o.a.s.c.SolrDeletionPolicy SolrDeletionPolicy.onCommit: commits: num=3 [junit4] 2> commit{dir=MockDirectoryWrapper(NRTCachingDirectory(MMapDirectory@/x1/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-6.x/solr/build/solr-core/test/J0/temp/solr.handler.TestReplicationHandler_D1ADDC59DD26247E-001/index-MMapDirectory-001 lockFactory=org.apache.lucene.store.NativeFSLockFactory@4fa89545; maxCacheMB=0.01171875 maxMergeSizeMB=0.2802734375)),segFN=segments_1,generation=1} [junit4] 2> commit{dir=MockDirectoryWrapper(NRTCachingDirectory(MMapDirectory@/x1/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-6.x/solr/build/solr-core/test/J0/temp/solr.handler.TestReplicationHandler_D1ADDC59DD26247E-001/index-MMapDirectory-001 lockFactory=org.apache.lucene.store.NativeFSLockFactory@4fa89545; maxCacheMB=0.01171875 maxMergeSizeMB=0.2802734375)),segFN=segments_2,generation=2} [junit4] 2> commit{dir=MockDirectoryWrapper(NRTCachingDirectory(MMapDirectory@/x1/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-6.x/solr/build/solr-core/test/J0/temp/solr.handler.TestReplicationHandler_D1ADDC59DD26247E-001/index-MMapDirectory-001 lockFactory=org.apache.lucene.store.NativeFSLockFactory@4fa89545; maxCacheMB=0.01171875 maxMergeSizeMB=0.2802734375)),segFN=segments_3,generation=3} [junit4] 2> 1567522 INFO (qtp1998444025-70254) [ x:collection1] o.a.s.c.SolrDeletionPolicy newest commit generation = 3 [junit4] 2> 1567523 INFO (qtp1998444025-70254) [ x:collection1] o.a.s.s.SolrIndexSearcher Opening [Searcher@46b13bd1[collection1] main] [junit4] 2> 1567523 INFO (qtp1998444025-70254) [ x:collection1] o.a.s.u.DirectUpdateHandler2 end_commit_flush [junit4] 2> 1567523 INFO (searcherExecutor-2899-thread-1-processing-x:collection1) [ x:collection1] o.a.s.c.SolrCore [collection1] Registered new searcher Searcher@46b13bd1[collection1] main{ExitableDirectoryReader(UninvertingDirectoryReader(Uninverting(_0(6.1.0):C1) Uninverting(_1(6.1.0):C1)))} [junit4] 2> 1567523 INFO (qtp1998444025-70254) [ x:collection1] o.a.s.u.p.LogUpdateProcessorFactory [collection1] webapp=/solr path=/update params={commit=true&wt=javabin&version=2}{commit=} 0 20 [junit4] 2> 1567531 WARN (explicit-fetchindex-cmd) [ x:collection1] o.a.s.h.IndexFetcher 'masterUrl' must be specified without the /replication suffix [junit4] 2> 1567535 INFO (qtp1998444025-70258) [ x:collection1] o.a.s.c.S.Request [collection1] webapp=/solr path=/replication params={qt=/replication&wt=javabin&version=2&command=indexversion} status=0 QTime=0 [junit4] 2> 1567536 INFO (explicit-fetchindex-cmd) [ x:collection1] o.a.s.h.IndexFetcher Master's generation: 3 [junit4] 2> 1567536 INFO (explicit-fetchindex-cmd) [ x:collection1] o.a.s.h.IndexFetcher Slave's generation: 2 [junit4] 2> 1567536 INFO (explicit-fetchindex-cmd) [ x:collection1] o.a.s.h.IndexFetcher Starting replication process [junit4] 2> 1567545 INFO (qtp1998444025-70258) [ x:collection1] o.a.s.c.S.Request [collection1] webapp=/solr path=/replication params={generation=3&qt=/replication&wt=javabin&version=2&command=filelist} status=0 QTime=4 [junit4] 2> 1567545 INFO (explicit-fetchindex-cmd) [ x:collection1] o.a.s.h.IndexFetcher Number of files in latest index in master: 19 [junit4] 2> 1567546 INFO (explicit-fetchindex-cmd) [ x:collection1] o.a.s.c.CachingDirectoryFactory return new directory for /x1/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-6.x/solr/build/solr-core/test/J0/temp/solr.handler.TestReplicationHandler_D1ADDC59DD26247E-001/solr-instance-002/./collection1/data/index.20160309024601821 [junit4] 2> 1567556 INFO (explicit-fetchindex-cmd) [ x:collection1] o.a.s.u.DefaultSolrCoreState Rollback old IndexWriter... core=collection1 [junit4] 2> 1567557 INFO (explicit-fetchindex-cmd) [ x:collection1] o.a.s.u.RandomMergePolicy RandomMergePolicy wrapping class org.apache.lucene.index.MockRandomMergePolicy: org.apache.lucene.index.MockRandomMergePolicy@6767a479 [junit4] 2> 1567558 INFO (explicit-fetchindex-cmd) [ x:collection1] o.a.s.c.SolrDeletionPolicy SolrDeletionPolicy.onInit: commits: num=1 [junit4] 2> commit{dir=MockDirectoryWrapper(NRTCachingDirectory(MMapDirectory@/x1/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-6.x/solr/build/solr-core/test/J0/temp/solr.handler.TestReplicationHandler_D1ADDC59DD26247E-001/index-MMapDirectory-002 lockFactory=org.apache.lucene.store.NativeFSLockFactory@4fa89545; maxCacheMB=0.01171875 maxMergeSizeMB=0.2802734375)),segFN=segments_2,generation=2} [junit4] 2> 1567558 INFO (explicit-fetchindex-cmd) [ x:collection1] o.a.s.c.SolrDeletionPolicy newest commit generation = 2 [junit4] 2> 1567559 INFO (explicit-fetchindex-cmd) [ x:collection1] o.a.s.u.DefaultSolrCoreState New IndexWriter is ready to be used. [junit4] 2> 1567559 INFO (explicit-fetchindex-cmd) [ x:collection1] o.a.s.c.SolrDeletionPolicy SolrDeletionPolicy.onCommit: commits: num=1 [junit4] 2> commit{dir=MockDirectoryWrapper(NRTCachingDirectory(MMapDirectory@/x1/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-6.x/solr/build/solr-core/test/J0/temp/solr.handler.TestReplicationHandler_D1ADDC59DD26247E-001/index-MMapDirectory-002 lockFactory=org.apache.lucene.store.NativeFSLockFactory@4fa89545; maxCacheMB=0.01171875 maxMergeSizeMB=0.2802734375)),segFN=segments_2,generation=2} [junit4] 2> 1567559 INFO (explicit-fetchindex-cmd) [ x:collection1] o.a.s.c.SolrDeletionPolicy newest commit generation = 2 [junit4] 2> 1567560 INFO (explicit-fetchindex-cmd) [ x:collection1] o.a.s.u.DefaultSolrCoreState Rollback old IndexWriter... core=collection1 [junit4] 2> 1567560 INFO (explicit-fetchindex-cmd) [ x:collection1] o.a.s.h.IndexFetcher Starting download (fullCopy=false) to MockDirectoryWrapper(SimpleFSDirectory@/x1/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-6.x/solr/build/solr-core/test/J0/temp/solr.handler.TestReplicationHandler_D1ADDC59DD26247E-001/index-SimpleFSDirectory-004 lockFactory=org.apache.lucene.store.NativeFSLockFactory@4fa89545) [junit4] 2> 1567560 INFO (explicit-fetchindex-cmd) [ x:collection1] o.a.s.h.IndexFetcher Skipping download for _0.si because it already exists [junit4] 2> 1567560 INFO (explicit-fetchindex-cmd) [ x:collection1] o.a.s.h.IndexFetcher Skipping download for _0.nvd because it already exists [junit4] 2> 1567561 INFO (explicit-fetchindex-cmd) [ x:collection1] o.a.s.h.IndexFetcher Skipping download for _0.tip because it already exists [junit4] 2> 1567561 INFO (explicit-fetchindex-cmd) [ x:collection1] o.a.s.h.IndexFetcher Skipping download for _0.fdx because it already exists [junit4] 2> 1567561 INFO (explicit-fetchindex-cmd) [ x:collection1] o.a.s.h.IndexFetcher Skipping download for _0.doc because it already exists [junit4] 2> 1567561 INFO (explicit-fetchindex-cmd) [ x:collection1] o.a.s.h.IndexFetcher Skipping download for _0.tim because it already exists [junit4] 2> 1567561 INFO (explicit-fetchindex-cmd) [ x:collection1] o.a.s.h.IndexFetcher Skipping download for _0.fdt because it already exists [junit4] 2> 1567561 INFO (explicit-fetchindex-cmd) [ x:collection1] o.a.s.h.IndexFetcher Skipping download for _0.fnm because it already exists [junit4] 2> 1567562 INFO (explicit-fetchindex-cmd) [ x:collection1] o.a.s.h.IndexFetcher Skipping download for _0.nvm because it already exists [junit4] 2> 1567564 INFO (qtp1998444025-70252) [ x:collection1] o.a.s.c.S.Request [collection1] webapp=/solr path=/replication params={generation=3&qt=/replication&file=_1.si&checksum=true&wt=filestream&command=filecontent} status=0 QTime=0 [junit4] 2> 1567578 INFO (qtp1998444025-70252) [ x:collection1] o.a.s.c.S.Request [collection1] webapp=/solr path=/replication params={generation=3&qt=/replication&file=_1.nvd&checksum=true&wt=filestream&command=filecontent} status=0 QTime=0 [junit4] 2> 1567581 INFO (qtp1998444025-70257) [ x:collection1] o.a.s.c.S.Request [collection1] webapp=/solr path=/replication params={generation=3&qt=/replication&file=_1.doc&checksum=true&wt=filestream&command=filecontent} status=0 QTime=0 [junit4] 2> 1567586 INFO (qtp1998444025-70254) [ x:collection1] o.a.s.c.S.Request [collection1] webapp=/solr path=/replication params={generation=3&qt=/replication&file=_1.tim&checksum=true&wt=filestream&command=filecontent} status=0 QTime=0 [junit4] 2> 1567589 INFO (qtp1998444025-70256) [ x:collection1] o.a.s.c.S.Request [collection1] webapp=/solr path=/replication params={generation=3&qt=/replication&file=_1.tip&checksum=true&wt=filestream&command=filecontent} status=0 QTime=0 [junit4] 2> 1567592 INFO (qtp1998444025-70258) [ x:collection1] o.a.s.c.S.Request [collection1] webapp=/solr path=/replication params={generation=3&qt=/replication&file=_1.fdx&checksum=true&wt=filestream&command=filecontent} status=0 QTime=0 [junit4] 2> 1567594 INFO (qtp1998444025-70255) [ x:collection1] o.a.s.c.S.Request [collection1] webapp=/solr path=/replication params={generation=3&qt=/replication&file=_1.fnm&checksum=true&wt=filestream&command=filecontent} status=0 QTime=0 [junit4] 2> 1567597 INFO (qtp1998444025-70252) [ x:collection1] o.a.s.c.S.Request [collection1] webapp=/solr path=/replication params={generation=3&qt=/replication&file=_1.nvm&checksum=true&wt=filestream&command=filecontent} status=0 QTime=0 [junit4] 2> 1567600 INFO (qtp1998444025-70257) [ x:collection1] o.a.s.c.S.Request [collection1] webapp=/solr path=/replication params={generation=3&qt=/replication&file=_1.fdt&checksum=true&wt=filestream&command=filecontent} status=0 QTime=0 [junit4] 2> 1567603 INFO (qtp1998444025-70254) [ x:collection1] o.a.s.c.S.Request [collection1] webapp=/solr path=/replication params={generation=3&qt=/replication&file=segments_3&checksum=true&wt=filestream&command=filecontent} status=0 QTime=0 [junit4] 2> 1567603 INFO (explicit-fetchindex-cmd) [ x:collection1] o.a.s.h.IndexFetcher Total time taken for download (fullCopy=false,bytesDownloaded=1474) : 0 secs (null bytes/sec) to MockDirectoryWrapper(SimpleFSDirectory@/x1/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-6.x/solr/build/solr-core/test/J0/temp/solr.handler.TestReplicationHandler_D1ADDC59DD26247E-001/index-SimpleFSDirectory-004 lockFactory=org.apache.lucene.store.NativeFSLockFactory@4fa89545) [junit4] 2> 1567624 INFO (explicit-fetchindex-cmd) [ x:collection1] o.a.s.u.RandomMergePolicy RandomMergePolicy wrapping class org.apache.lucene.index.MockRandomMergePolicy: org.apache.lucene.index.MockRandomMergePolicy@32714ead [junit4] 2> 1567636 INFO (explicit-fetchindex-cmd) [ x:collection1] o.a.s.c.SolrDeletionPolicy SolrDeletionPolicy.onInit: commits: num=2 [junit4] 2> commit{dir=MockDirectoryWrapper(NRTCachingDirectory(MMapDirectory@/x1/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-6.x/solr/build/solr-core/test/J0/temp/solr.handler.TestReplicationHandler_D1ADDC59DD26247E-001/index-MMapDirectory-002 lockFactory=org.apache.lucene.store.NativeFSLockFactory@4fa89545; maxCacheMB=0.01171875 maxMergeSizeMB=0.2802734375)),segFN=segments_2,generation=2} [junit4] 2> commit{dir=MockDirectoryWrapper(NRTCachingDirectory(MMapDirectory@/x1/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-6.x/solr/build/solr-core/test/J0/temp/solr.handler.TestReplicationHandler_D1ADDC59DD26247E-001/index-MMapDirectory-002 lockFactory=org.apache.lucene.store.NativeFSLockFactory@4fa89545; maxCacheMB=0.01171875 maxMergeSizeMB=0.2802734375)),segFN=segments_3,generation=3} [junit4] 2> 1567637 INFO (explicit-fetchindex-cmd) [ x:collection1] o.a.s.c.SolrDeletionPolicy newest commit generation = 3 [junit4] 2> 1567649 INFO (explicit-fetchindex-cmd) [ x:collection1] o.a.s.u.DefaultSolrCoreState New IndexWriter is ready to be used. [junit4] 2> 1567659 INFO (explicit-fetchindex-cmd) [ x:collection1] o.a.s.s.SolrIndexSearcher Opening [Searcher@39fd980[collection1] main] [junit4] 2> 1567659 INFO (searcherExecutor-2909-thread-1-processing-x:collection1) [ x:collection1] o.a.s.c.SolrCore [collection1] Registered new searcher Searcher@39fd980[collection1] main{ExitableDirectoryReader(UninvertingDirectoryReader(Uninverting(_0(6.1.0):C1) Uninverting(_1(6.1.0):C1)))} [junit4] 2> 1567659 INFO (explicit-fetchindex-cmd) [ x:collection1] o.a.s.c.CachingDirectoryFactory looking to close /x1/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-6.x/solr/build/solr-core/test/J0/temp/solr.handler.TestReplicationHandler_D1ADDC59DD26247E-001/solr-instance-002/./collection1/data/index.20160309024601821 [CachedDir<<refCount=0;path=/x1/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-6.x/solr/build/solr-core/test/J0/temp/solr.handler.TestReplicationHandler_D1ADDC59DD26247E-001/solr-instance-002/./collection1/data/index.20160309024601821;done=true>>] [junit4] 2> 1567660 INFO (explicit-fetchindex-cmd) [ x:collection1] o.a.s.c.CachingDirectoryFactory Closing directory: /x1/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-6.x/solr/build/solr-core/test/J0/temp/solr.handler.TestReplicationHandler_D1ADDC59DD26247E-001/solr-instance-002/./collection1/data/index.20160309024601821 [junit4] 2> 1567661 INFO (qtp1931771852-70273) [ x:collection1] o.a.s.c.S.Request [collection1] webapp=/solr path=/replication params={wait=true&masterUrl=http://127.0.0.1:54644/solr/collection1/replication&command=fetchindex} status=0 QTime=136 [junit4] 2> 1567663 INFO (qtp1931771852-70269) [ x:collection1] o.a.s.c.S.Request [collection1] webapp=/solr path=/select params={q=name:empty2&sort=id+desc&wt=javabin&version=2} hits=1 status=0 QTime=0 [junit4] 2> 1567664 INFO (TEST-TestReplicationHandler.testEmptyCommits-seed#[D1ADDC59DD26247E]) [ ] o.a.s.h.TestReplicationHandler Waited for 0ms and found 1 docs [junit4] 2> 1567666 INFO (qtp1998444025-70251) [ x:collection1] o.a.s.c.S.Request [collection1] webapp=/solr path=/replication params={_trace=getDetails&qt=/replication&wt=javabin&version=2&command=details} status=0 QTime=0 [junit4] 2> 1567668 INFO (qtp1998444025-70258) [ x:collection1] o.a.s.c.S.Request [collection1] webapp=/solr path=/replication params={_trace=getDetails&qt=/replication&wt=javabin&version=2&command=details} status=0 QTime=0 [junit4] 2> 1567674 INFO (qtp1998444025-70256) [ x:collection1] o.a.s.c.S.Request [collection1] webapp=/solr path=/replication params={slave=false&qt=/replication&wt=javabin&version=2&command=details} status=0 QTime=1 [junit4] 2> 1567675 INFO (qtp1931771852-70276) [ x:collection1] o.a.s.c.S.Request [collection1] webapp=/solr path=/replication params={_trace=getDetails&qt=/replication&wt=javabin&version=2&command=details} status=0 QTime=4 [junit4] 2> 1567677 INFO (qtp1998444025-70255) [ x:collection1] o.a.s.c.S.Request [collection1] webapp=/solr path=/replication params={_trace=assertVersions&qt=/replication&wt=javabin&version=2&command=indexversion} status=0 QTime=0 [junit4] 2> 1567678 INFO (qtp1931771852-70275) [ x:collection1] o.a.s.c.S.Request [collection1] webapp=/solr path=/replication params={_trace=assertVersions&qt=/replication&wt=javabin&version=2&command=indexversion} status=0 QTime=0 [junit4] 2> 1567681 INFO (qtp1998444025-70255) [ x:collection1] o.a.s.u.p.LogUpdateProcessorFactory [collection1] webapp=/solr path=/update params={wt=javabin&version=2}{add=[3]} 0 0 [junit4] 2> 1567682 INFO (qtp1998444025-70254) [ x:collection1] o.a.s.u.DirectUpdateHandler2 start commit{,optimize=false,openSearcher=false,waitSearcher=true,expungeDeletes=false,softCommit=false,prepareCommit=false} [junit4] 2> 1567694 INFO (qtp1998444025-70254) [ x:collection1] o.a.s.c.SolrDeletionPolicy SolrDeletionPolicy.onCommit: commits: num=4 [junit4] 2> commit{dir=MockDirectoryWrapper(NRTCachingDirectory(MMapDirectory@/x1/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-6.x/solr/build/solr-core/test/J0/temp/solr.handler.TestReplicationHandler_D1ADDC59DD26247E-001/index-MMapDirectory-001 lockFactory=org.apache.lucene.store.NativeFSLockFactory@4fa89545; maxCacheMB=0.01171875 maxMergeSizeMB=0.2802734375)),segFN=segments_1,generation=1} [junit4] 2> commit{dir=MockDirectoryWrapper(NRTCachingDirectory(MMapDirectory@/x1/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-6.x/solr/build/solr-core/test/J0/temp/solr.handler.TestReplicationHandler_D1ADDC59DD26247E-001/index-MMapDirectory-001 lockFactory=org.apache.lucene.store.NativeFSLockFactory@4fa89545; maxCacheMB=0.01171875 maxMergeSizeMB=0.2802734375)),segFN=segments_2,generation=2} [junit4] 2> commit{dir=MockDirectoryWrapper(NRTCachingDirectory(MMapDirectory@/x1/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-6.x/solr/build/solr-core/test/J0/temp/solr.handler.TestReplicationHandler_D1ADDC59DD26247E-001/index-MMapDirectory-001 lockFactory=org.apache.lucene.store.NativeFSLockFactory@4fa89545; maxCacheMB=0.01171875 maxMergeSizeMB=0.2802734375)),segFN=segments_3,generation=3} [junit4] 2> commit{dir=MockDirectoryWrapper(NRTCachingDirectory(MMapDirectory@/x1/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-6.x/solr/build/solr-core/test/J0/temp/solr.handler.TestReplicationHandler_D1ADDC59DD26247E-001/index-MMapDirectory-001 lockFactory=org.apache.lucene.store.NativeFSLockFactory@4fa89545; maxCacheMB=0.01171875 maxMergeSizeMB=0.2802734375)),segFN=segments_4,generation=4} [junit4] 2> 1567695 INFO (qtp1998444025-70254) [ x:collection1] o.a.s.c.SolrDeletionPolicy newest commit generation = 4 [junit4] 2> 1567706 INFO (qtp1998444025-70254) [ x:collection1] o.a.s.s.SolrIndexSearcher Opening [Searcher@47bb9b64[collection1] realtime] [junit4] 2> 1567707 INFO (qtp1998444025-70254) [ x:collection1] o.a.s.u.DirectUpdateHandler2 end_commit_flush [junit4] 2> 1567707 INFO (qtp1998444025-70254) [ x:collection1] o.a.s.u.p.LogUpdateProcessorFactory [collection1] webapp=/solr path=/update params={openSearcher=false&commit=true&wt=javabin&version=2}{commit=} 0 24 [junit4] 2> 1567715 WARN (explicit-fetchindex-cmd) [ x:collection1] o.a.s.h.IndexFetcher 'masterUrl' must be specified without the /replication suffix [junit4] 2> 1567717 INFO (qtp1998444025-70252) [ x:collection1] o.a.s.c.S.Request [collection1] webapp=/solr path=/replication params={qt=/replication&wt=javabin&version=2&command=indexversion} status=0 QTime=0 [junit4] 2> 1567717 INFO (explicit-fetchindex-cmd) [ x:collection1] o.a.s.h.IndexFetcher Master's generation: 4 [junit4] 2> 1567718 INFO (explicit-fetchindex-cmd) [ x:collection1] o.a.s.h.IndexFetcher Slave's generation: 3 [junit4] 2> 1567718 INFO (explicit-fetchindex-cmd) [ x:collection1] o.a.s.h.IndexFetcher Starting replication process [junit4] 2> 1567728 INFO (qtp1998444025-70252) [ x:collection1] o.a.s.c.S.Request [collection1] webapp=/solr path=/replication params={generation=4&qt=/replication&wt=javabin&vers [...truncated too long message...] lection/95519249619681387-127.0.0.1:46117_qjx%2Fcp-n_0000000053 [junit4] 2> 3 /solr/overseer_elect/election/95519249619681348-127.0.0.1:43272_qjx%2Fcp-n_0000000032 [junit4] 2> 2 /solr/overseer_elect/election/95519249619681378-127.0.0.1:46632_qjx%2Fcp-n_0000000050 [junit4] 2> 2 /solr/overseer_elect/election/95519249619681291-127.0.0.1:33641_qjx%2Fcp-n_0000000019 [junit4] 2> 2 /solr/collections/collection1/leader_elect/shard2/election/95519249619681312-core_node9-n_0000000004 [junit4] 2> 2 /solr/collections/collection1/leader_elect/shard1/election/95519249619681297-core_node4-n_0000000001 [junit4] 2> 2 /solr/overseer_elect/election/95519249619681342-127.0.0.1:54375_qjx%2Fcp-n_0000000030 [junit4] 2> 2 /solr/overseer_elect/election/95519249619681309-127.0.0.1:36091_qjx%2Fcp-n_0000000025 [junit4] 2> 2 /solr/collections/collection1/leader_elect/shard2/election/95519249619681336-core_node11-n_0000000008 [junit4] 2> 2 /solr/overseer_elect/election/95519249619681357-127.0.0.1:54375_qjx%2Fcp-n_0000000035 [junit4] 2> 2 /solr/collections/collection1/leader_elect/shard1/election/95519249619681387-core_node16-n_0000000015 [junit4] 2> 2 /solr/collections/collection1/leader_elect/shard1/election/95519249619681327-core_node14-n_0000000006 [junit4] 2> 2 /solr/overseer_elect/election/95519249619681339-127.0.0.1:46117_qjx%2Fcp-n_0000000029 [junit4] 2> 2 /solr/collections/collection1/leader_elect/shard2/election/95519249619681354-core_node3-n_0000000011 [junit4] 2> 2 /solr/overseer_elect/election/95519249619681330-127.0.0.1:35904_qjx%2Fcp-n_0000000015 [junit4] 2> 2 /solr/collections/collection1/leader_elect/shard1/election/95519249619681378-core_node6-n_0000000013 [junit4] 2> 2 /solr/collections/collection1/leader_elect/shard2/election/95519249619681342-core_node9-n_0000000009 [junit4] 2> 2 /solr/overseer_elect/election/95519249619681324-127.0.0.1:32839_qjx%2Fcp-n_0000000013 [junit4] 2> 2 /solr/collections/collection1/leader_elect/shard2/election/95519249619681357-core_node9-n_0000000012 [junit4] 2> 2 /solr/collections/collection1/leader_elect/shard2/election/95519249619681288-core_node1-n_0000000000 [junit4] 2> 2 /solr/overseer_elect/election/95519249619681354-127.0.0.1:32919_qjx%2Fcp-n_0000000034 [junit4] 2> 2 /solr/collections/collection1/leader_elect/shard2/election/95519249619681372-core_node15-n_0000000015 [junit4] 2> 2 /solr/overseer_elect/election/95519249619681390-127.0.0.1:54375_qjx%2Fcp-n_0000000054 [junit4] 2> 2 /solr/overseer_elect/election/95519249619681300-127.0.0.1:57616_qjx%2Fcp-n_0000000022 [junit4] 2> [junit4] 2> Maximum concurrent children watches above limit: [junit4] 2> [junit4] 2> 40 /solr/collections [junit4] 2> 18 /solr/live_nodes [junit4] 2> 13 /solr/overseer/collection-queue-work [junit4] 2> 12 /solr/overseer/queue-work [junit4] 2> 9 /solr/overseer/queue [junit4] 2> [junit4] 2> NOTE: download the large Jenkins line-docs file by running 'ant get-jenkins-line-docs' in the lucene directory. [junit4] 2> NOTE: reproduce with: ant test -Dtestcase=RollingRestartTest -Dtests.method=test -Dtests.seed=D1ADDC59DD26247E -Dtests.multiplier=2 -Dtests.nightly=true -Dtests.slow=true -Dtests.linedocsfile=/x1/jenkins/lucene-data/enwiki.random.lines.txt -Dtests.locale=es-CU -Dtests.timezone=PRT -Dtests.asserts=true -Dtests.file.encoding=UTF-8 [junit4] FAILURE 263s J2 | RollingRestartTest.test <<< [junit4] > Throwable #1: java.lang.AssertionError: Unable to restart (#1): CloudJettyRunner [url=http://127.0.0.1:32919/qjx/cp/collection1] [junit4] > at __randomizedtesting.SeedInfo.seed([D1ADDC59DD26247E:59F9E38373DA4986]:0) [junit4] > at org.apache.solr.cloud.RollingRestartTest.restartWithRolesTest(RollingRestartTest.java:103) [junit4] > at org.apache.solr.cloud.RollingRestartTest.test(RollingRestartTest.java:52) [junit4] > at org.apache.solr.BaseDistributedSearchTestCase$ShardsRepeatRule$ShardsFixedStatement.callStatement(BaseDistributedSearchTestCase.java:996) [junit4] > at org.apache.solr.BaseDistributedSearchTestCase$ShardsRepeatRule$ShardsStatement.evaluate(BaseDistributedSearchTestCase.java:971) [junit4] > at java.lang.Thread.run(Thread.java:745) [junit4] 2> 3949798 INFO (SUITE-RollingRestartTest-seed#[D1ADDC59DD26247E]-worker) [ ] o.a.s.SolrTestCaseJ4 ###deleteCore [junit4] 2> NOTE: leaving temporary files on disk at: /x1/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-6.x/solr/build/solr-core/test/J2/temp/solr.cloud.RollingRestartTest_D1ADDC59DD26247E-001 [junit4] 2> Mar 09, 2016 7:25:44 AM com.carrotsearch.randomizedtesting.ThreadLeakControl checkThreadLeaks [junit4] 2> WARNING: Will linger awaiting termination of 1 leaked thread(s). [junit4] 2> NOTE: test params are: codec=FastCompressingStoredFields(storedFieldsFormat=CompressingStoredFieldsFormat(compressionMode=FAST, chunkSize=20930, maxDocsPerChunk=104, blockSize=8), termVectorsFormat=CompressingTermVectorsFormat(compressionMode=FAST, chunkSize=20930, blockSize=8)), sim=ClassicSimilarity, locale=es-CU, timezone=PRT [junit4] 2> NOTE: Linux 3.13.0-52-generic amd64/Oracle Corporation 1.8.0_66 (64-bit)/cpus=4,threads=1,free=93062288,total=508559360 [junit4] 2> NOTE: All tests run in this JVM: [HdfsTlogReplayBufferedWhileIndexingTest, BasicDistributedZk2Test, TestBulkSchemaConcurrent, SecurityConfHandlerTest, SSLMigrationTest, TestFilteredDocIdSet, AnalyticsMergeStrategyTest, TestSolrJ, BlockDirectoryTest, DistanceUnitsTest, TestComplexPhraseQParserPlugin, OverseerTaskQueueTest, TestCloudDeleteByQuery, TestFuzzyAnalyzedSuggestions, TestReloadDeadlock, LeaderInitiatedRecoveryOnCommitTest, TestJsonFacets, FullHLLTest, RegexBoostProcessorTest, ScriptEngineTest, TestFastWriter, TestSchemaResource, TestLRUStatsCache, AutoCommitTest, TestRebalanceLeaders, RulesTest, TestFieldTypeCollectionResource, TestExtendedDismaxParser, SearchHandlerTest, DistributedQueryComponentCustomSortTest, TestCollationField, TestPivotHelperCode, TestRecovery, TestDistributedMissingSort, TestSweetSpotSimilarityFactory, TestSolrCLIRunExample, CdcrRequestHandlerTest, FacetPivotSmallTest, HardAutoCommitTest, XmlUpdateRequestHandlerTest, TestReqParamsAPI, FieldAnalysisRequestHandlerTest, TestAddFieldRealTimeGet, DirectUpdateHandlerTest, SuggesterTest, TestSearchPerf, DocValuesMissingTest, UpdateParamsTest, TestInfoStreamLogging, TestSolrCloudWithKerberosAlt, TestMacros, DirectUpdateHandlerOptimizeTest, BadComponentTest, PluginInfoTest, TestPerFieldSimilarityWithDefaultOverride, TestStressRecovery, CdcrUpdateLogTest, StressHdfsTest, ExitableDirectoryReaderTest, TestSort, HighlighterMaxOffsetTest, TestConfigSetsAPIZkFailure, OverseerTest, OverseerCollectionConfigSetProcessorTest, ReplicationFactorTest, LukeRequestHandlerTest, TestReversedWildcardFilterFactory, FieldMutatingUpdateProcessorTest, HighlighterConfigTest, BadIndexSchemaTest, BigEndianAscendingWordSerializerTest, HdfsRestartWhileUpdatingTest, TestSha256AuthenticationProvider, ShowFileRequestHandlerTest, TestUniqueKeyFieldResource, CleanupOldIndexTest, DeleteLastCustomShardedReplicaTest, NoCacheHeaderTest, TestSortingResponseWriter, SuggestComponentTest, TestWriterPerf, TestCharFilters, TestRestManager, TestFreeTextSuggestions, SliceStateTest, TestRequestStatusCollectionAPI, DocValuesMultiTest, DocExpirationUpdateProcessorFactoryTest, TestCloudSchemaless, TermVectorComponentDistributedTest, TestRawResponseWriter, SolrTestCaseJ4Test, TestSolrConfigHandlerCloud, TestSolrQueryParser, BinaryUpdateRequestHandlerTest, TestStressReorder, BasicDistributedZkTest, UnloadDistributedZkTest, CollectionsAPIDistributedZkTest, SuggesterFSTTest, TestStressLucene, SolrCoreCheckLockOnStartupTest, QueryEqualityTest, TestSolrDeletionPolicy1, XsltUpdateRequestHandlerTest, StandardRequestHandlerTest, PrimitiveFieldTypeTest, RequestHandlersTest, TestJmxIntegration, QueryParsingTest, TestComponentsName, TestLFUCache, AsyncMigrateRouteKeyTest, CdcrVersionReplicationTest, CloudExitableDirectoryReaderTest, CollectionReloadTest, CollectionStateFormat2Test, CollectionTooManyReplicasTest, CollectionsAPISolrJTest, ConcurrentDeleteAndCreateCollectionTest, DeleteReplicaTest, DistribJoinFromCollectionTest, LeaderFailoverAfterPartitionTest, MultiThreadedOCPTest, OverseerRolesTest, RollingRestartTest] [junit4] Completed [451/579 (5!)] on J2 in 263.92s, 1 test, 1 failure <<< FAILURES! [...truncated 404 lines...] BUILD FAILED /x1/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-6.x/build.xml:747: The following error occurred while executing this line: /x1/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-6.x/build.xml:684: The following error occurred while executing this line: /x1/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-6.x/build.xml:59: The following error occurred while executing this line: /x1/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-6.x/solr/build.xml:233: The following error occurred while executing this line: /x1/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-6.x/solr/common-build.xml:524: The following error occurred while executing this line: /x1/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-6.x/lucene/common-build.xml:1457: The following error occurred while executing this line: /x1/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-6.x/lucene/common-build.xml:1014: There were test failures: 579 suites (10 ignored), 2309 tests, 1 suite-level error, 2 errors, 2 failures, 34 ignored (17 assumptions) [seed: D1ADDC59DD26247E] Total time: 207 minutes 8 seconds Build step 'Invoke Ant' marked build as failure Archiving artifacts No prior successful build to compare, so performing full copy of artifacts Recording test results Email was triggered for: Failure - Any Sending email for trigger: Failure - Any
--------------------------------------------------------------------- To unsubscribe, e-mail: dev-unsubscr...@lucene.apache.org For additional commands, e-mail: dev-h...@lucene.apache.org