Build: http://jenkins.thetaphi.de/job/Lucene-Solr-master-Solaris/785/
Java: 64bit/jdk1.8.0 -XX:+UseCompressedOops -XX:+UseG1GC

3 tests failed.
FAILED:  
org.apache.solr.cloud.CdcrBootstrapTest.testBootstrapWithContinousIndexingOnSourceCluster

Error Message:
Document mismatch on target after sync expected:<20000> but was:<15200>

Stack Trace:
java.lang.AssertionError: Document mismatch on target after sync 
expected:<20000> but was:<15200>
        at 
__randomizedtesting.SeedInfo.seed([8E92EFD6C8B062D:DCAC65A48BDDB5D6]:0)
        at org.junit.Assert.fail(Assert.java:93)
        at org.junit.Assert.failNotEquals(Assert.java:647)
        at org.junit.Assert.assertEquals(Assert.java:128)
        at org.junit.Assert.assertEquals(Assert.java:472)
        at 
org.apache.solr.cloud.CdcrBootstrapTest.testBootstrapWithContinousIndexingOnSourceCluster(CdcrBootstrapTest.java:334)
        at sun.reflect.NativeMethodAccessorImpl.invoke0(Native Method)
        at 
sun.reflect.NativeMethodAccessorImpl.invoke(NativeMethodAccessorImpl.java:62)
        at 
sun.reflect.DelegatingMethodAccessorImpl.invoke(DelegatingMethodAccessorImpl.java:43)
        at java.lang.reflect.Method.invoke(Method.java:498)
        at 
com.carrotsearch.randomizedtesting.RandomizedRunner.invoke(RandomizedRunner.java: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 
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.update.AutoCommitTest.testMaxTime

Error Message:
Exception during query

Stack Trace:
java.lang.RuntimeException: Exception during query
        at 
__randomizedtesting.SeedInfo.seed([8E92EFD6C8B062D:921D531FF2119A11]:0)
        at org.apache.solr.SolrTestCaseJ4.assertQ(SolrTestCaseJ4.java:782)
        at 
org.apache.solr.update.AutoCommitTest.testMaxTime(AutoCommitTest.java:243)
        at sun.reflect.NativeMethodAccessorImpl.invoke0(Native Method)
        at 
sun.reflect.NativeMethodAccessorImpl.invoke(NativeMethodAccessorImpl.java:62)
        at 
sun.reflect.DelegatingMethodAccessorImpl.invoke(DelegatingMethodAccessorImpl.java:43)
        at java.lang.reflect.Method.invoke(Method.java:498)
        at 
com.carrotsearch.randomizedtesting.RandomizedRunner.invoke(RandomizedRunner.java: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 
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.RuntimeException: REQUEST FAILED: 
xpath=//result[@numFound=1]
        xml response was: <?xml version="1.0" encoding="UTF-8"?>
<response>
<lst name="responseHeader"><int name="status">0</int><int 
name="QTime">0</int></lst><result name="response" numFound="0" 
start="0"></result>
</response>

        request was:q=id:529&qt=standard&start=0&rows=20&version=2.2
        at org.apache.solr.SolrTestCaseJ4.assertQ(SolrTestCaseJ4.java:775)
        ... 40 more


FAILED:  
org.apache.solr.common.cloud.TestCollectionStateWatchers.testDeletionsTriggerWatches

Error Message:
Error from server at https://127.0.0.1:59726/solr: Could not find collection : 
tobedeleted

Stack Trace:
org.apache.solr.client.solrj.impl.HttpSolrClient$RemoteSolrException: Error 
from server at https://127.0.0.1:59726/solr: Could not find collection : 
tobedeleted
        at 
__randomizedtesting.SeedInfo.seed([E4E71EE81F326B09:4626D6679D51BD64]:0)
        at 
org.apache.solr.client.solrj.impl.HttpSolrClient.executeMethod(HttpSolrClient.java:608)
        at 
org.apache.solr.client.solrj.impl.HttpSolrClient.request(HttpSolrClient.java:261)
        at 
org.apache.solr.client.solrj.impl.HttpSolrClient.request(HttpSolrClient.java:250)
        at 
org.apache.solr.client.solrj.impl.LBHttpSolrClient.doRequest(LBHttpSolrClient.java:413)
        at 
org.apache.solr.client.solrj.impl.LBHttpSolrClient.request(LBHttpSolrClient.java:366)
        at 
org.apache.solr.client.solrj.impl.CloudSolrClient.sendRequest(CloudSolrClient.java:1291)
        at 
org.apache.solr.client.solrj.impl.CloudSolrClient.requestWithRetryOnStaleState(CloudSolrClient.java:1061)
        at 
org.apache.solr.client.solrj.impl.CloudSolrClient.request(CloudSolrClient.java:997)
        at 
org.apache.solr.client.solrj.SolrRequest.process(SolrRequest.java:149)
        at 
org.apache.solr.client.solrj.SolrRequest.process(SolrRequest.java:166)
        at 
org.apache.solr.common.cloud.TestCollectionStateWatchers.testDeletionsTriggerWatches(TestCollectionStateWatchers.java:275)
        at sun.reflect.NativeMethodAccessorImpl.invoke0(Native Method)
        at 
sun.reflect.NativeMethodAccessorImpl.invoke(NativeMethodAccessorImpl.java:62)
        at 
sun.reflect.DelegatingMethodAccessorImpl.invoke(DelegatingMethodAccessorImpl.java:43)
        at java.lang.reflect.Method.invoke(Method.java:498)
        at 
com.carrotsearch.randomizedtesting.RandomizedRunner.invoke(RandomizedRunner.java: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 
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)




Build Log:
[...truncated 10500 lines...]
   [junit4] Suite: org.apache.solr.update.AutoCommitTest
   [junit4]   2> Creating dataDir: 
/export/home/jenkins/workspace/Lucene-Solr-master-Solaris/solr/build/solr-core/test/J1/temp/solr.update.AutoCommitTest_8E92EFD6C8B062D-001/init-core-data-001
   [junit4]   2> 12900 INFO  
(SUITE-AutoCommitTest-seed#[8E92EFD6C8B062D]-worker) [    ] 
o.a.s.SolrTestCaseJ4 Randomized ssl (false) and clientAuth (true) via: 
@org.apache.solr.util.RandomizeSSL(reason=, value=NaN, ssl=NaN, clientAuth=NaN)
   [junit4]   2> 12900 INFO  
(SUITE-AutoCommitTest-seed#[8E92EFD6C8B062D]-worker) [    ] 
o.a.s.SolrTestCaseJ4 ####initCore
   [junit4]   2> 12900 INFO  
(SUITE-AutoCommitTest-seed#[8E92EFD6C8B062D]-worker) [    ] 
o.a.s.c.SolrResourceLoader new SolrResourceLoader for directory: 
'/export/home/jenkins/workspace/Lucene-Solr-master-Solaris/solr/core/src/test-files/solr/collection1'
   [junit4]   2> 12900 INFO  
(SUITE-AutoCommitTest-seed#[8E92EFD6C8B062D]-worker) [    ] 
o.a.s.c.SolrResourceLoader JNDI not configured for solr (NoInitialContextEx)
   [junit4]   2> 12900 INFO  
(SUITE-AutoCommitTest-seed#[8E92EFD6C8B062D]-worker) [    ] 
o.a.s.c.SolrResourceLoader using system property solr.solr.home: 
/export/home/jenkins/workspace/Lucene-Solr-master-Solaris/solr/core/src/test-files/solr
   [junit4]   2> 12901 INFO  
(SUITE-AutoCommitTest-seed#[8E92EFD6C8B062D]-worker) [    ] 
o.a.s.c.SolrResourceLoader Adding 
'file:/export/home/jenkins/workspace/Lucene-Solr-master-Solaris/solr/core/src/test-files/solr/collection1/lib/classes/'
 to classloader
   [junit4]   2> 12901 INFO  
(SUITE-AutoCommitTest-seed#[8E92EFD6C8B062D]-worker) [    ] 
o.a.s.c.SolrResourceLoader Adding 
'file:/export/home/jenkins/workspace/Lucene-Solr-master-Solaris/solr/core/src/test-files/solr/collection1/lib/README'
 to classloader
   [junit4]   2> 12937 INFO  
(SUITE-AutoCommitTest-seed#[8E92EFD6C8B062D]-worker) [    ] o.a.s.c.SolrConfig 
current version of requestparams : -1
   [junit4]   2> 12947 WARN  
(SUITE-AutoCommitTest-seed#[8E92EFD6C8B062D]-worker) [    ] o.a.s.c.Config 
Beginning with Solr 5.5, <mergePolicy> is deprecated, use <mergePolicyFactory> 
instead.
   [junit4]   2> 12949 INFO  
(SUITE-AutoCommitTest-seed#[8E92EFD6C8B062D]-worker) [    ] o.a.s.c.SolrConfig 
Using Lucene MatchVersion: 7.0.0
   [junit4]   2> 12982 INFO  
(SUITE-AutoCommitTest-seed#[8E92EFD6C8B062D]-worker) [    ] o.a.s.c.SolrConfig 
Loaded SolrConfig: solrconfig.xml
   [junit4]   2> 12995 INFO  
(SUITE-AutoCommitTest-seed#[8E92EFD6C8B062D]-worker) [    ] o.a.s.s.IndexSchema 
[null] Schema name=test
   [junit4]   2> 13262 INFO  
(SUITE-AutoCommitTest-seed#[8E92EFD6C8B062D]-worker) [    ] 
o.a.s.s.OpenExchangeRatesOrgProvider Initialized with 
rates=open-exchange-rates.json, refreshInterval=1440.
   [junit4]   2> 13272 INFO  
(SUITE-AutoCommitTest-seed#[8E92EFD6C8B062D]-worker) [    ] o.a.s.s.IndexSchema 
default search field in schema is text
   [junit4]   2> 13273 INFO  
(SUITE-AutoCommitTest-seed#[8E92EFD6C8B062D]-worker) [    ] o.a.s.s.IndexSchema 
unique key field: id
   [junit4]   2> 13300 INFO  
(SUITE-AutoCommitTest-seed#[8E92EFD6C8B062D]-worker) [    ] 
o.a.s.s.FileExchangeRateProvider Reloading exchange rates from file currency.xml
   [junit4]   2> 13304 INFO  
(SUITE-AutoCommitTest-seed#[8E92EFD6C8B062D]-worker) [    ] 
o.a.s.s.FileExchangeRateProvider Reloading exchange rates from file currency.xml
   [junit4]   2> 13307 INFO  
(SUITE-AutoCommitTest-seed#[8E92EFD6C8B062D]-worker) [    ] 
o.a.s.s.OpenExchangeRatesOrgProvider Reloading exchange rates from 
open-exchange-rates.json
   [junit4]   2> 13309 INFO  
(SUITE-AutoCommitTest-seed#[8E92EFD6C8B062D]-worker) [    ] 
o.a.s.s.OpenExchangeRatesOrgProvider Reloading exchange rates from 
open-exchange-rates.json
   [junit4]   2> 13310 INFO  
(SUITE-AutoCommitTest-seed#[8E92EFD6C8B062D]-worker) [    ] 
o.a.s.c.SolrResourceLoader JNDI not configured for solr (NoInitialContextEx)
   [junit4]   2> 13310 INFO  
(SUITE-AutoCommitTest-seed#[8E92EFD6C8B062D]-worker) [    ] 
o.a.s.c.SolrResourceLoader using system property solr.solr.home: 
/export/home/jenkins/workspace/Lucene-Solr-master-Solaris/solr/core/src/test-files/solr
   [junit4]   2> 13310 INFO  
(SUITE-AutoCommitTest-seed#[8E92EFD6C8B062D]-worker) [    ] 
o.a.s.c.SolrResourceLoader new SolrResourceLoader for directory: 
'/export/home/jenkins/workspace/Lucene-Solr-master-Solaris/solr/core/src/test-files/solr'
   [junit4]   2> 13310 INFO  
(SUITE-AutoCommitTest-seed#[8E92EFD6C8B062D]-worker) [    ] 
o.a.s.c.SolrResourceLoader JNDI not configured for solr (NoInitialContextEx)
   [junit4]   2> 13310 INFO  
(SUITE-AutoCommitTest-seed#[8E92EFD6C8B062D]-worker) [    ] 
o.a.s.c.SolrResourceLoader using system property solr.solr.home: 
/export/home/jenkins/workspace/Lucene-Solr-master-Solaris/solr/core/src/test-files/solr
   [junit4]   2> 13310 INFO  
(SUITE-AutoCommitTest-seed#[8E92EFD6C8B062D]-worker) [    ] 
o.a.s.c.CoreContainer New CoreContainer 479490843
   [junit4]   2> 13310 INFO  
(SUITE-AutoCommitTest-seed#[8E92EFD6C8B062D]-worker) [    ] 
o.a.s.c.CoreContainer Loading cores into CoreContainer 
[instanceDir=/export/home/jenkins/workspace/Lucene-Solr-master-Solaris/solr/core/src/test-files/solr]
   [junit4]   2> 13311 WARN  
(SUITE-AutoCommitTest-seed#[8E92EFD6C8B062D]-worker) [    ] 
o.a.s.c.CoreContainer Couldn't add files from 
/export/home/jenkins/workspace/Lucene-Solr-master-Solaris/solr/core/src/test-files/solr/lib
 to classpath: 
/export/home/jenkins/workspace/Lucene-Solr-master-Solaris/solr/core/src/test-files/solr/lib
   [junit4]   2> 13311 INFO  
(SUITE-AutoCommitTest-seed#[8E92EFD6C8B062D]-worker) [    ] 
o.a.s.h.c.HttpShardHandlerFactory created with socketTimeout : 
600000,connTimeout : 60000,maxConnectionsPerHost : 20,maxConnections : 
10000,corePoolSize : 0,maximumPoolSize : 2147483647,maxThreadIdleTime : 
5,sizeOfQueue : -1,fairnessPolicy : false,
   [junit4]   2> 13328 INFO  
(SUITE-AutoCommitTest-seed#[8E92EFD6C8B062D]-worker) [    ] 
o.a.s.u.UpdateShardHandler Created UpdateShardHandler HTTP client with params: 
socketTimeout=30000&connTimeout=30000&maxConnections=100000&maxConnectionsPerHost=100000
   [junit4]   2> 13344 INFO  
(SUITE-AutoCommitTest-seed#[8E92EFD6C8B062D]-worker) [    ] o.a.s.l.LogWatcher 
SLF4J impl is org.slf4j.impl.Log4jLoggerFactory
   [junit4]   2> 13345 INFO  
(SUITE-AutoCommitTest-seed#[8E92EFD6C8B062D]-worker) [    ] o.a.s.l.LogWatcher 
Registering Log Listener [Log4j (org.slf4j.impl.Log4jLoggerFactory)]
   [junit4]   2> 13345 INFO  
(SUITE-AutoCommitTest-seed#[8E92EFD6C8B062D]-worker) [    ] 
o.a.s.c.CoreContainer Security conf doesn't exist. Skipping setup for 
authorization module.
   [junit4]   2> 13345 INFO  
(SUITE-AutoCommitTest-seed#[8E92EFD6C8B062D]-worker) [    ] 
o.a.s.c.CoreContainer No authentication plugin used.
   [junit4]   2> 13351 INFO  
(SUITE-AutoCommitTest-seed#[8E92EFD6C8B062D]-worker) [    ] 
o.a.s.c.CoreDescriptor Created CoreDescriptor: {name=collection1, 
config=solrconfig.xml, transient=false, schema=schema.xml, loadOnStartup=true, 
configSetProperties=configsetprops.json, collection=collection1, 
dataDir=/export/home/jenkins/workspace/Lucene-Solr-master-Solaris/solr/build/solr-core/test/J1/temp/solr.update.AutoCommitTest_8E92EFD6C8B062D-001/init-core-data-001,
 shard=shard1}
   [junit4]   2> 13358 INFO  (coreLoadExecutor-19-thread-1) [    ] 
o.a.s.c.SolrResourceLoader new SolrResourceLoader for directory: 
'/export/home/jenkins/workspace/Lucene-Solr-master-Solaris/solr/core/src/test-files/solr/collection1'
   [junit4]   2> 13360 INFO  (coreLoadExecutor-19-thread-1) [    ] 
o.a.s.c.SolrResourceLoader JNDI not configured for solr (NoInitialContextEx)
   [junit4]   2> 13360 INFO  (coreLoadExecutor-19-thread-1) [    ] 
o.a.s.c.SolrResourceLoader using system property solr.solr.home: 
/export/home/jenkins/workspace/Lucene-Solr-master-Solaris/solr/core/src/test-files/solr
   [junit4]   2> 13360 INFO  (coreLoadExecutor-19-thread-1) [    ] 
o.a.s.c.SolrResourceLoader Adding 
'file:/export/home/jenkins/workspace/Lucene-Solr-master-Solaris/solr/core/src/test-files/solr/collection1/lib/classes/'
 to classloader
   [junit4]   2> 13360 INFO  (coreLoadExecutor-19-thread-1) [    ] 
o.a.s.c.SolrResourceLoader Adding 
'file:/export/home/jenkins/workspace/Lucene-Solr-master-Solaris/solr/core/src/test-files/solr/collection1/lib/README'
 to classloader
   [junit4]   2> 13416 INFO  (coreLoadExecutor-19-thread-1) [    ] 
o.a.s.c.SolrConfig current version of requestparams : -1
   [junit4]   2> 13428 WARN  (coreLoadExecutor-19-thread-1) [    ] 
o.a.s.c.Config Beginning with Solr 5.5, <mergePolicy> is deprecated, use 
<mergePolicyFactory> instead.
   [junit4]   2> 13430 INFO  (coreLoadExecutor-19-thread-1) [    ] 
o.a.s.c.SolrConfig Using Lucene MatchVersion: 7.0.0
   [junit4]   2> 13457 INFO  (coreLoadExecutor-19-thread-1) [    ] 
o.a.s.c.SolrConfig Loaded SolrConfig: solrconfig.xml
   [junit4]   2> 13474 INFO  (coreLoadExecutor-19-thread-1) [    ] 
o.a.s.s.IndexSchema [collection1] Schema name=test
   [junit4]   2> 13769 INFO  (coreLoadExecutor-19-thread-1) [    ] 
o.a.s.s.OpenExchangeRatesOrgProvider Initialized with 
rates=open-exchange-rates.json, refreshInterval=1440.
   [junit4]   2> 13812 INFO  (coreLoadExecutor-19-thread-1) [    ] 
o.a.s.s.IndexSchema default search field in schema is text
   [junit4]   2> 13814 INFO  (coreLoadExecutor-19-thread-1) [    ] 
o.a.s.s.IndexSchema unique key field: id
   [junit4]   2> 13851 INFO  (coreLoadExecutor-19-thread-1) [    ] 
o.a.s.s.FileExchangeRateProvider Reloading exchange rates from file currency.xml
   [junit4]   2> 13856 INFO  (coreLoadExecutor-19-thread-1) [    ] 
o.a.s.s.FileExchangeRateProvider Reloading exchange rates from file currency.xml
   [junit4]   2> 13859 INFO  (coreLoadExecutor-19-thread-1) [    ] 
o.a.s.s.OpenExchangeRatesOrgProvider Reloading exchange rates from 
open-exchange-rates.json
   [junit4]   2> 13859 INFO  (coreLoadExecutor-19-thread-1) [    ] 
o.a.s.s.OpenExchangeRatesOrgProvider Reloading exchange rates from 
open-exchange-rates.json
   [junit4]   2> 13862 INFO  (coreLoadExecutor-19-thread-1) [    ] 
o.a.s.c.ConfigSetProperties Did not find ConfigSet properties, assuming default 
properties: Can't find resource 'configsetprops.json' in classpath or 
'/export/home/jenkins/workspace/Lucene-Solr-master-Solaris/solr/core/src/test-files/solr/collection1'
   [junit4]   2> 13862 INFO  (coreLoadExecutor-19-thread-1) [    ] 
o.a.s.c.CoreContainer Creating SolrCore 'collection1' using configuration from 
instancedir 
/export/home/jenkins/workspace/Lucene-Solr-master-Solaris/solr/core/src/test-files/solr/collection1
   [junit4]   2> 13863 INFO  (coreLoadExecutor-19-thread-1) [    x:collection1] 
o.a.s.c.SolrCore org.apache.solr.core.MockDirectoryFactory
   [junit4]   2> 13863 INFO  (coreLoadExecutor-19-thread-1) [    x:collection1] 
o.a.s.c.SolrCore [[collection1] ] Opening new SolrCore at 
[/export/home/jenkins/workspace/Lucene-Solr-master-Solaris/solr/core/src/test-files/solr/collection1],
 
dataDir=[/export/home/jenkins/workspace/Lucene-Solr-master-Solaris/solr/build/solr-core/test/J1/temp/solr.update.AutoCommitTest_8E92EFD6C8B062D-001/init-core-data-001/]
   [junit4]   2> 13865 INFO  (coreLoadExecutor-19-thread-1) [    x:collection1] 
o.a.s.c.JmxMonitoredMap No JMX servers found, not exposing Solr information 
with JMX.
   [junit4]   2> 13865 INFO  (coreLoadExecutor-19-thread-1) [    x:collection1] 
o.a.s.c.CachingDirectoryFactory return new directory for 
/export/home/jenkins/workspace/Lucene-Solr-master-Solaris/solr/build/solr-core/test/J1/temp/solr.update.AutoCommitTest_8E92EFD6C8B062D-001/init-core-data-001/snapshot_metadata
   [junit4]   2> 13865 INFO  (coreLoadExecutor-19-thread-1) [    x:collection1] 
o.a.s.c.s.SolrSnapshotMetaDataManager Loading from snapshot metadata file...
   [junit4]   2> 13866 INFO  (coreLoadExecutor-19-thread-1) [    x:collection1] 
o.a.s.c.CachingDirectoryFactory return new directory for 
/export/home/jenkins/workspace/Lucene-Solr-master-Solaris/solr/build/solr-core/test/J1/temp/solr.update.AutoCommitTest_8E92EFD6C8B062D-001/init-core-data-001
   [junit4]   2> 13866 INFO  (coreLoadExecutor-19-thread-1) [    x:collection1] 
o.a.s.c.SolrCore New index directory detected: old=null 
new=/export/home/jenkins/workspace/Lucene-Solr-master-Solaris/solr/build/solr-core/test/J1/temp/solr.update.AutoCommitTest_8E92EFD6C8B062D-001/init-core-data-001/index/
   [junit4]   2> 13866 WARN  (coreLoadExecutor-19-thread-1) [    x:collection1] 
o.a.s.c.SolrCore [collection1] Solr index directory 
'/export/home/jenkins/workspace/Lucene-Solr-master-Solaris/solr/build/solr-core/test/J1/temp/solr.update.AutoCommitTest_8E92EFD6C8B062D-001/init-core-data-001/index'
 doesn't exist. Creating new index...
   [junit4]   2> 13867 INFO  (coreLoadExecutor-19-thread-1) [    x:collection1] 
o.a.s.c.CachingDirectoryFactory return new directory for 
/export/home/jenkins/workspace/Lucene-Solr-master-Solaris/solr/build/solr-core/test/J1/temp/solr.update.AutoCommitTest_8E92EFD6C8B062D-001/init-core-data-001/index
   [junit4]   2> 13867 INFO  (coreLoadExecutor-19-thread-1) [    x:collection1] 
o.a.s.u.RandomMergePolicy RandomMergePolicy wrapping class 
org.apache.lucene.index.TieredMergePolicy: [TieredMergePolicy: 
maxMergeAtOnce=48, maxMergeAtOnceExplicit=47, maxMergedSegmentMB=56.8212890625, 
floorSegmentMB=0.72265625, forceMergeDeletesPctAllowed=2.2615346011380124, 
segmentsPerTier=10.0, maxCFSSegmentSizeMB=8.796093022207999E12, 
noCFSRatio=0.5128717423882211
   [junit4]   2> 13867 INFO  (coreLoadExecutor-19-thread-1) [    x:collection1] 
o.a.s.c.SolrDeletionPolicy SolrDeletionPolicy.onCommit: commits: num=1
   [junit4]   2>        commit{dir=MockDirectoryWrapper(RAMDirectory@21eba727 
lockFactory=org.apache.lucene.store.SingleInstanceLockFactory@7eccd918),segFN=segments_1,generation=1}
   [junit4]   2> 13867 INFO  (coreLoadExecutor-19-thread-1) [    x:collection1] 
o.a.s.c.SolrDeletionPolicy newest commit generation = 1
   [junit4]   2> 13868 INFO  
(OldIndexDirectoryCleanupThreadForCore-collection1) [    x:collection1] 
o.a.s.c.SolrCore Looking for old index directories to cleanup for core 
collection1 in 
/export/home/jenkins/workspace/Lucene-Solr-master-Solaris/solr/build/solr-core/test/J1/temp/solr.update.AutoCommitTest_8E92EFD6C8B062D-001/init-core-data-001/
   [junit4]   2> 14041 INFO  (coreLoadExecutor-19-thread-1) [    x:collection1] 
o.a.s.u.p.UpdateRequestProcessorChain creating updateRequestProcessorChain 
"dedupe"
   [junit4]   2> 14041 INFO  (coreLoadExecutor-19-thread-1) [    x:collection1] 
o.a.s.u.p.UpdateRequestProcessorChain inserting 
DistributedUpdateProcessorFactory into updateRequestProcessorChain "dedupe"
   [junit4]   2> 14041 INFO  (coreLoadExecutor-19-thread-1) [    x:collection1] 
o.a.s.u.p.UpdateRequestProcessorChain creating updateRequestProcessorChain 
"dedupe-allfields"
   [junit4]   2> 14041 INFO  (coreLoadExecutor-19-thread-1) [    x:collection1] 
o.a.s.u.p.UpdateRequestProcessorChain inserting 
DistributedUpdateProcessorFactory into updateRequestProcessorChain 
"dedupe-allfields"
   [junit4]   2> 14042 INFO  (coreLoadExecutor-19-thread-1) [    x:collection1] 
o.a.s.u.p.UpdateRequestProcessorChain creating updateRequestProcessorChain 
"stored_sig"
   [junit4]   2> 14042 INFO  (coreLoadExecutor-19-thread-1) [    x:collection1] 
o.a.s.u.p.UpdateRequestProcessorChain inserting 
DistributedUpdateProcessorFactory into updateRequestProcessorChain "stored_sig"
   [junit4]   2> 14042 INFO  (coreLoadExecutor-19-thread-1) [    x:collection1] 
o.a.s.u.p.UpdateRequestProcessorChain creating updateRequestProcessorChain 
"uniq-fields"
   [junit4]   2> 14044 INFO  (coreLoadExecutor-19-thread-1) [    x:collection1] 
o.a.s.u.p.UpdateRequestProcessorChain inserting 
DistributedUpdateProcessorFactory into updateRequestProcessorChain "uniq-fields"
   [junit4]   2> 14044 INFO  (coreLoadExecutor-19-thread-1) [    x:collection1] 
o.a.s.u.p.UpdateRequestProcessorChain creating updateRequestProcessorChain 
"distrib-dup-test-chain-explicit"
   [junit4]   2> 14045 INFO  (coreLoadExecutor-19-thread-1) [    x:collection1] 
o.a.s.u.p.UpdateRequestProcessorChain creating updateRequestProcessorChain 
"distrib-dup-test-chain-implicit"
   [junit4]   2> 14045 INFO  (coreLoadExecutor-19-thread-1) [    x:collection1] 
o.a.s.u.p.UpdateRequestProcessorChain inserting 
DistributedUpdateProcessorFactory into updateRequestProcessorChain 
"distrib-dup-test-chain-implicit"
   [junit4]   2> 14045 INFO  (coreLoadExecutor-19-thread-1) [    x:collection1] 
o.a.s.c.SolrCore no updateRequestProcessorChain defined as default, creating 
implicit default
   [junit4]   2> 14047 INFO  (coreLoadExecutor-19-thread-1) [    x:collection1] 
o.a.s.h.l.XMLLoader xsltCacheLifetimeSeconds=60
   [junit4]   2> 14048 INFO  (coreLoadExecutor-19-thread-1) [    x:collection1] 
o.a.s.h.l.XMLLoader xsltCacheLifetimeSeconds=60
   [junit4]   2> 14052 INFO  (coreLoadExecutor-19-thread-1) [    x:collection1] 
o.a.s.h.l.XMLLoader xsltCacheLifetimeSeconds=60
   [junit4]   2> 14054 INFO  (coreLoadExecutor-19-thread-1) [    x:collection1] 
o.a.s.h.l.XMLLoader xsltCacheLifetimeSeconds=60
   [junit4]   2> 14109 INFO  (coreLoadExecutor-19-thread-1) [    x:collection1] 
o.a.s.c.PluginBag requestHandler : 'lazy' created with startup=lazy 
   [junit4]   2> 14179 INFO  (coreLoadExecutor-19-thread-1) [    x:collection1] 
o.a.s.c.RequestHandlers Registered paths: 
/admin/mbeans,standard,spellCheckCompRH,lazy,/update/json/docs,/admin/luke,/export,spellCheckWithWordbreak_Direct,tvrh,/get,/admin/properties,/update/json,mltrh,/admin/threads,/search-facet-def,/update/csv,/sql,/graph,/search-facet-invariants,/admin/segments,spellCheckCompRH1,/mlt,/admin/system,/replication,dismax,defaults,/config,/stream,/schema,/admin/plugins,/admin/logging,spellCheckWithWordbreak,mock,/admin/ping,/update,/admin/file,/terms,spellCheckCompRH_Direct,/debug/dump
   [junit4]   2> 14179 INFO  (coreLoadExecutor-19-thread-1) [    x:collection1] 
o.a.s.c.SolrCore Using default statsCache cache: 
org.apache.solr.search.stats.LocalStatsCache
   [junit4]   2> 14181 INFO  (coreLoadExecutor-19-thread-1) [    x:collection1] 
o.a.s.u.UpdateHandler Using UpdateLog implementation: 
org.apache.solr.update.UpdateLog
   [junit4]   2> 14181 INFO  (coreLoadExecutor-19-thread-1) [    x:collection1] 
o.a.s.u.UpdateLog Initializing UpdateLog: dataDir= defaultSyncLevel=FLUSH 
numRecordsToKeep=100 maxNumLogsToKeep=10 numVersionBuckets=65536
   [junit4]   2> 14182 INFO  (coreLoadExecutor-19-thread-1) [    x:collection1] 
o.a.s.u.CommitTracker Hard AutoCommit: disabled
   [junit4]   2> 14182 INFO  (coreLoadExecutor-19-thread-1) [    x:collection1] 
o.a.s.u.CommitTracker Soft AutoCommit: disabled
   [junit4]   2> 14182 INFO  (coreLoadExecutor-19-thread-1) [    x:collection1] 
o.a.s.u.RandomMergePolicy RandomMergePolicy wrapping class 
org.apache.lucene.index.TieredMergePolicy: [TieredMergePolicy: 
maxMergeAtOnce=12, maxMergeAtOnceExplicit=35, maxMergedSegmentMB=96.26953125, 
floorSegmentMB=0.39453125, forceMergeDeletesPctAllowed=26.344636917029753, 
segmentsPerTier=14.0, maxCFSSegmentSizeMB=8.796093022207999E12, 
noCFSRatio=0.48197725809567626
   [junit4]   2> 14183 INFO  (coreLoadExecutor-19-thread-1) [    x:collection1] 
o.a.s.c.SolrDeletionPolicy SolrDeletionPolicy.onInit: commits: num=1
   [junit4]   2>        commit{dir=MockDirectoryWrapper(RAMDirectory@21eba727 
lockFactory=org.apache.lucene.store.SingleInstanceLockFactory@7eccd918),segFN=segments_1,generation=1}
   [junit4]   2> 14183 INFO  (coreLoadExecutor-19-thread-1) [    x:collection1] 
o.a.s.c.SolrDeletionPolicy newest commit generation = 1
   [junit4]   2> 14183 INFO  (coreLoadExecutor-19-thread-1) [    x:collection1] 
o.a.s.s.SolrIndexSearcher Opening [Searcher@31c262e3[collection1] main]
   [junit4]   2> 14183 INFO  (coreLoadExecutor-19-thread-1) [    x:collection1] 
o.a.s.r.RestManager Initializing RestManager with initArgs: 
{storageIO=org.apache.solr.rest.ManagedResourceStorage$InMemoryStorageIO}
   [junit4]   2> 14183 INFO  (coreLoadExecutor-19-thread-1) [    x:collection1] 
o.a.s.r.ManagedResourceStorage Reading _rest_managed.json using InMemoryStorage
   [junit4]   2> 14183 INFO  (coreLoadExecutor-19-thread-1) [    x:collection1] 
o.a.s.r.RestManager Initializing 0 registered ManagedResources
   [junit4]   2> 14183 INFO  (coreLoadExecutor-19-thread-1) [    x:collection1] 
o.a.s.h.c.SpellCheckComponent Initializing spell checkers
   [junit4]   2> 14274 INFO  (coreLoadExecutor-19-thread-1) [    x:collection1] 
o.a.s.s.DirectSolrSpellChecker init: 
{name=direct,classname=DirectSolrSpellChecker,field=lowerfilt,minQueryLength=3}
   [junit4]   2> 14368 INFO  (coreLoadExecutor-19-thread-1) [    x:collection1] 
o.a.s.h.ReplicationHandler Commits will be reserved for  10000
   [junit4]   2> 14373 INFO  (coreLoadExecutor-19-thread-1) [    x:collection1] 
o.a.s.u.UpdateLog Looking up max value of version field to seed version buckets
   [junit4]   2> 14373 INFO  (coreLoadExecutor-19-thread-1) [    x:collection1] 
o.a.s.u.VersionInfo Refreshing highest value of _version_ for 65536 version 
buckets from index
   [junit4]   2> 14373 INFO  (coreLoadExecutor-19-thread-1) [    x:collection1] 
o.a.s.u.VersionInfo No terms found for _version_, cannot seed version bucket 
highest value from index
   [junit4]   2> 14373 INFO  (coreLoadExecutor-19-thread-1) [    x:collection1] 
o.a.s.u.UpdateLog Could not find max version in index or recent updates, using 
new clock 1542831446861807616
   [junit4]   2> 14369 INFO  
(searcherExecutor-20-thread-1-processing-x:collection1) [    x:collection1] 
o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: default
   [junit4]   2> 14376 INFO  (coreLoadExecutor-19-thread-1) [    x:collection1] 
o.a.s.u.UpdateLog Took 2.0ms to seed version buckets with highest version 
1542831446861807616
   [junit4]   2> 14376 INFO  (coreLoadExecutor-19-thread-1) [    x:collection1] 
o.a.s.c.CoreContainer registering core: collection1
   [junit4]   2> 14396 INFO  
(searcherExecutor-20-thread-1-processing-x:collection1) [    x:collection1] 
o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: direct
   [junit4]   2> 14396 INFO  
(searcherExecutor-20-thread-1-processing-x:collection1) [    x:collection1] 
o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: wordbreak
   [junit4]   2> 14396 INFO  
(searcherExecutor-20-thread-1-processing-x:collection1) [    x:collection1] 
o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: 
multipleFields
   [junit4]   2> 14397 INFO  
(searcherExecutor-20-thread-1-processing-x:collection1) [    x:collection1] 
o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: jarowinkler
   [junit4]   2> 14397 INFO  
(SUITE-AutoCommitTest-seed#[8E92EFD6C8B062D]-worker) [    ] 
o.a.s.SolrTestCaseJ4 ####initCore end
   [junit4]   2> 14397 INFO  
(searcherExecutor-20-thread-1-processing-x:collection1) [    x:collection1] 
o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: external
   [junit4]   2> 14398 INFO  
(searcherExecutor-20-thread-1-processing-x:collection1) [    x:collection1] 
o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: freq
   [junit4]   2> 14402 INFO  
(searcherExecutor-20-thread-1-processing-x:collection1) [    x:collection1] 
o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: fqcn
   [junit4]   2> 14403 INFO  
(searcherExecutor-20-thread-1-processing-x:collection1) [    x:collection1] 
o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: perDict
   [junit4]   2> 14403 INFO  
(searcherExecutor-20-thread-1-processing-x:collection1) [    x:collection1] 
o.a.s.c.SolrCore [collection1] Registered new searcher 
Searcher@31c262e3[collection1] 
main{ExitableDirectoryReader(UninvertingDirectoryReader())}
   [junit4]   2> 14413 INFO  
(TEST-AutoCommitTest.testMaxTime-seed#[8E92EFD6C8B062D]) [    ] 
o.a.s.SolrTestCaseJ4 ###Starting testMaxTime
   [junit4]   2> 14503 INFO  
(TEST-AutoCommitTest.testMaxTime-seed#[8E92EFD6C8B062D]) [    ] 
o.a.s.u.p.LogUpdateProcessorFactory [collection1]  webapp=null path=null 
params={}{deleteByQuery=*:* (-1542831446903750656)} 0 89
   [junit4]   2> 14507 INFO  
(TEST-AutoCommitTest.testMaxTime-seed#[8E92EFD6C8B062D]) [    ] 
o.a.s.c.SolrResourceLoader new SolrResourceLoader for directory: 
'/export/home/jenkins/workspace/Lucene-Solr-master-Solaris/solr/core/src/test-files/solr/collection1'
   [junit4]   2> 14508 INFO  
(TEST-AutoCommitTest.testMaxTime-seed#[8E92EFD6C8B062D]) [    ] 
o.a.s.c.SolrResourceLoader JNDI not configured for solr (NoInitialContextEx)
   [junit4]   2> 14508 INFO  
(TEST-AutoCommitTest.testMaxTime-seed#[8E92EFD6C8B062D]) [    ] 
o.a.s.c.SolrResourceLoader using system property solr.solr.home: 
/export/home/jenkins/workspace/Lucene-Solr-master-Solaris/solr/core/src/test-files/solr
   [junit4]   2> 14508 INFO  
(TEST-AutoCommitTest.testMaxTime-seed#[8E92EFD6C8B062D]) [    ] 
o.a.s.c.SolrResourceLoader Adding 
'file:/export/home/jenkins/workspace/Lucene-Solr-master-Solaris/solr/core/src/test-files/solr/collection1/lib/classes/'
 to classloader
   [junit4]   2> 14508 INFO  
(TEST-AutoCommitTest.testMaxTime-seed#[8E92EFD6C8B062D]) [    ] 
o.a.s.c.SolrResourceLoader Adding 
'file:/export/home/jenkins/workspace/Lucene-Solr-master-Solaris/solr/core/src/test-files/solr/collection1/lib/README'
 to classloader
   [junit4]   2> 14543 INFO  
(TEST-AutoCommitTest.testMaxTime-seed#[8E92EFD6C8B062D]) [    ] 
o.a.s.c.SolrConfig current version of requestparams : -1
   [junit4]   2> 14553 WARN  
(TEST-AutoCommitTest.testMaxTime-seed#[8E92EFD6C8B062D]) [    ] o.a.s.c.Config 
Beginning with Solr 5.5, <mergePolicy> is deprecated, use <mergePolicyFactory> 
instead.
   [junit4]   2> 14555 INFO  
(TEST-AutoCommitTest.testMaxTime-seed#[8E92EFD6C8B062D]) [    ] 
o.a.s.c.SolrConfig Using Lucene MatchVersion: 7.0.0
   [junit4]   2> 14577 INFO  
(TEST-AutoCommitTest.testMaxTime-seed#[8E92EFD6C8B062D]) [    ] 
o.a.s.c.SolrConfig Loaded SolrConfig: solrconfig.xml
   [junit4]   2> 14589 INFO  
(TEST-AutoCommitTest.testMaxTime-seed#[8E92EFD6C8B062D]) [    ] 
o.a.s.s.IndexSchema [collection1] Schema name=test
   [junit4]   2> 14700 INFO  
(TEST-AutoCommitTest.testMaxTime-seed#[8E92EFD6C8B062D]) [    ] 
o.a.s.s.OpenExchangeRatesOrgProvider Initialized with 
rates=open-exchange-rates.json, refreshInterval=1440.
   [junit4]   2> 14718 INFO  
(TEST-AutoCommitTest.testMaxTime-seed#[8E92EFD6C8B062D]) [    ] 
o.a.s.s.IndexSchema default search field in schema is text
   [junit4]   2> 14719 INFO  
(TEST-AutoCommitTest.testMaxTime-seed#[8E92EFD6C8B062D]) [    ] 
o.a.s.s.IndexSchema unique key field: id
   [junit4]   2> 14730 INFO  
(TEST-AutoCommitTest.testMaxTime-seed#[8E92EFD6C8B062D]) [    ] 
o.a.s.s.FileExchangeRateProvider Reloading exchange rates from file currency.xml
   [junit4]   2> 14817 INFO  
(TEST-AutoCommitTest.testMaxTime-seed#[8E92EFD6C8B062D]) [    ] 
o.a.s.s.FileExchangeRateProvider Reloading exchange rates from file currency.xml
   [junit4]   2> 14821 INFO  
(TEST-AutoCommitTest.testMaxTime-seed#[8E92EFD6C8B062D]) [    ] 
o.a.s.s.OpenExchangeRatesOrgProvider Reloading exchange rates from 
open-exchange-rates.json
   [junit4]   2> 14822 INFO  
(TEST-AutoCommitTest.testMaxTime-seed#[8E92EFD6C8B062D]) [    ] 
o.a.s.s.OpenExchangeRatesOrgProvider Reloading exchange rates from 
open-exchange-rates.json
   [junit4]   2> 14827 INFO  
(TEST-AutoCommitTest.testMaxTime-seed#[8E92EFD6C8B062D]) [    ] 
o.a.s.c.ConfigSetProperties Did not find ConfigSet properties, assuming default 
properties: Can't find resource 'configsetprops.json' in classpath or 
'/export/home/jenkins/workspace/Lucene-Solr-master-Solaris/solr/core/src/test-files/solr/collection1'
   [junit4]   2> 14828 INFO  
(TEST-AutoCommitTest.testMaxTime-seed#[8E92EFD6C8B062D]) [    ] 
o.a.s.c.CoreContainer Reloading SolrCore 'collection1' using configuration from 
instancedir 
/export/home/jenkins/workspace/Lucene-Solr-master-Solaris/solr/core/src/test-files/solr/collection1
   [junit4]   2> 14829 INFO  
(TEST-AutoCommitTest.testMaxTime-seed#[8E92EFD6C8B062D]) [    x:collection1] 
o.a.s.c.SolrCore [[collection1] ] Opening new SolrCore at 
[/export/home/jenkins/workspace/Lucene-Solr-master-Solaris/solr/core/src/test-files/solr/collection1],
 
dataDir=[/export/home/jenkins/workspace/Lucene-Solr-master-Solaris/solr/build/solr-core/test/J1/temp/solr.update.AutoCommitTest_8E92EFD6C8B062D-001/init-core-data-001/]
   [junit4]   2> 14829 INFO  
(TEST-AutoCommitTest.testMaxTime-seed#[8E92EFD6C8B062D]) [    x:collection1] 
o.a.s.c.JmxMonitoredMap No JMX servers found, not exposing Solr information 
with JMX.
   [junit4]   2> 14835 INFO  
(TEST-AutoCommitTest.testMaxTime-seed#[8E92EFD6C8B062D]) [    x:collection1] 
o.a.s.c.s.SolrSnapshotMetaDataManager Loading from snapshot metadata file...
   [junit4]   2> 14837 INFO  
(TEST-AutoCommitTest.testMaxTime-seed#[8E92EFD6C8B062D]) [    x:collection1] 
o.a.s.c.SolrCore New index directory detected: old=null 
new=/export/home/jenkins/workspace/Lucene-Solr-master-Solaris/solr/build/solr-core/test/J1/temp/solr.update.AutoCommitTest_8E92EFD6C8B062D-001/init-core-data-001/index/
   [junit4]   2> 14837 INFO  
(OldIndexDirectoryCleanupThreadForCore-collection1) [    x:collection1] 
o.a.s.c.SolrCore Looking for old index directories to cleanup for core 
collection1 in 
/export/home/jenkins/workspace/Lucene-Solr-master-Solaris/solr/build/solr-core/test/J1/temp/solr.update.AutoCommitTest_8E92EFD6C8B062D-001/init-core-data-001/
   [junit4]   2> 14840 INFO  
(TEST-AutoCommitTest.testMaxTime-seed#[8E92EFD6C8B062D]) [    x:collection1] 
o.a.s.u.p.UpdateRequestProcessorChain creating updateRequestProcessorChain 
"dedupe"
   [junit4]   2> 14840 INFO  
(TEST-AutoCommitTest.testMaxTime-seed#[8E92EFD6C8B062D]) [    x:collection1] 
o.a.s.u.p.UpdateRequestProcessorChain inserting 
DistributedUpdateProcessorFactory into updateRequestProcessorChain "dedupe"
   [junit4]   2> 14840 INFO  
(TEST-AutoCommitTest.testMaxTime-seed#[8E92EFD6C8B062D]) [    x:collection1] 
o.a.s.u.p.UpdateRequestProcessorChain creating updateRequestProcessorChain 
"dedupe-allfields"
   [junit4]   2> 14840 INFO  
(TEST-AutoCommitTest.testMaxTime-seed#[8E92EFD6C8B062D]) [    x:collection1] 
o.a.s.u.p.UpdateRequestProcessorChain inserting 
DistributedUpdateProcessorFactory into updateRequestProcessorChain 
"dedupe-allfields"
   [junit4]   2> 14840 INFO  
(TEST-AutoCommitTest.testMaxTime-seed#[8E92EFD6C8B062D]) [    x:collection1] 
o.a.s.u.p.UpdateRequestProcessorChain creating updateRequestProcessorChain 
"stored_sig"
   [junit4]   2> 14841 INFO  
(TEST-AutoCommitTest.testMaxTime-seed#[8E92EFD6C8B062D]) [    x:collection1] 
o.a.s.u.p.UpdateRequestProcessorChain inserting 
DistributedUpdateProcessorFactory into updateRequestProcessorChain "stored_sig"
   [junit4]   2> 14841 INFO  
(TEST-AutoCommitTest.testMaxTime-seed#[8E92EFD6C8B062D]) [    x:collection1] 
o.a.s.u.p.UpdateRequestProcessorChain creating updateRequestProcessorChain 
"uniq-fields"
   [junit4]   2> 14841 INFO  
(TEST-AutoCommitTest.testMaxTime-seed#[8E92EFD6C8B062D]) [    x:collection1] 
o.a.s.u.p.UpdateRequestProcessorChain inserting 
DistributedUpdateProcessorFactory into updateRequestProcessorChain "uniq-fields"
   [junit4]   2> 14841 INFO  
(TEST-AutoCommitTest.testMaxTime-seed#[8E92EFD6C8B062D]) [    x:collection1] 
o.a.s.u.p.UpdateRequestProcessorChain creating updateRequestProcessorChain 
"distrib-dup-test-chain-explicit"
   [junit4]   2> 14842 INFO  
(TEST-AutoCommitTest.testMaxTime-seed#[8E92EFD6C8B062D]) [    x:collection1] 
o.a.s.u.p.UpdateRequestProcessorChain creating updateRequestProcessorChain 
"distrib-dup-test-chain-implicit"
   [junit4]   2> 14842 INFO  
(TEST-AutoCommitTest.testMaxTime-seed#[8E92EFD6C8B062D]) [    x:collection1] 
o.a.s.u.p.UpdateRequestProcessorChain inserting 
DistributedUpdateProcessorFactory into updateRequestProcessorChain 
"distrib-dup-test-chain-implicit"
   [junit4]   2> 14842 INFO  
(TEST-AutoCommitTest.testMaxTime-seed#[8E92EFD6C8B062D]) [    x:collection1] 
o.a.s.c.SolrCore no updateRequestProcessorChain defined as default, creating 
implicit default
   [junit4]   2> 14844 INFO  
(TEST-AutoCommitTest.testMaxTime-seed#[8E92EFD6C8B062D]) [    x:collection1] 
o.a.s.h.l.XMLLoader xsltCacheLifetimeSeconds=60
   [junit4]   2> 14845 INFO  
(TEST-AutoCommitTest.testMaxTime-seed#[8E92EFD6C8B062D]) [    x:collection1] 
o.a.s.h.l.XMLLoader xsltCacheLifetimeSeconds=60
   [junit4]   2> 14846 INFO  
(TEST-AutoCommitTest.testMaxTime-seed#[8E92EFD6C8B062D]) [    x:collection1] 
o.a.s.h.l.XMLLoader xsltCacheLifetimeSeconds=60
   [junit4]   2> 14847 INFO  
(TEST-AutoCommitTest.testMaxTime-seed#[8E92EFD6C8B062D]) [    x:collection1] 
o.a.s.h.l.XMLLoader xsltCacheLifetimeSeconds=60
   [junit4]   2> 14850 INFO  
(TEST-AutoCommitTest.testMaxTime-seed#[8E92EFD6C8B062D]) [    x:collection1] 
o.a.s.c.PluginBag requestHandler : 'lazy' created with startup=lazy 
   [junit4]   2> 14853 INFO  
(TEST-AutoCommitTest.testMaxTime-seed#[8E92EFD6C8B062D]) [    x:collection1] 
o.a.s.c.RequestHandlers Registered paths: 
/admin/mbeans,standard,spellCheckCompRH,lazy,/update/json/docs,/admin/luke,/export,spellCheckWithWordbreak_Direct,tvrh,/get,/admin/properties,/update/json,mltrh,/admin/threads,/search-facet-def,/update/csv,/sql,/graph,/search-facet-invariants,/admin/segments,spellCheckCompRH1,/mlt,/admin/system,/replication,dismax,defaults,/config,/stream,/schema,/admin/plugins,/admin/logging,spellCheckWithWordbreak,mock,/admin/ping,/update,/admin/file,/terms,spellCheckCompRH_Direct,/debug/dump
   [junit4]   2> 14853 INFO  
(TEST-AutoCommitTest.testMaxTime-seed#[8E92EFD6C8B062D]) [    x:collection1] 
o.a.s.c.SolrCore Using default statsCache cache: 
org.apache.solr.search.stats.LocalStatsCache
   [junit4]   2> 14855 INFO  
(TEST-AutoCommitTest.testMaxTime-seed#[8E92EFD6C8B062D]) [    x:collection1] 
o.a.s.u.CommitTracker Hard AutoCommit: disabled
   [junit4]   2> 14856 INFO  
(TEST-AutoCommitTest.testMaxTime-seed#[8E92EFD6C8B062D]) [    x:collection1] 
o.a.s.u.CommitTracker Soft AutoCommit: disabled
   [junit4]   2> 14860 INFO  
(TEST-AutoCommitTest.testMaxTime-seed#[8E92EFD6C8B062D]) [    x:collection1] 
o.a.s.s.SolrIndexSearcher Opening [Searcher@1e2a8087[collection1] main]
   [junit4]   2> 14860 INFO  
(TEST-AutoCommitTest.testMaxTime-seed#[8E92EFD6C8B062D]) [    x:collection1] 
o.a.s.r.RestManager Initializing RestManager with initArgs: 
{storageIO=org.apache.solr.rest.ManagedResourceStorage$InMemoryStorageIO}
   [junit4]   2> 14861 INFO  
(TEST-AutoCommitTest.testMaxTime-seed#[8E92EFD6C8B062D]) [    x:collection1] 
o.a.s.r.ManagedResourceStorage Reading _rest_managed.json using InMemoryStorage
   [junit4]   2> 14862 INFO  
(TEST-AutoCommitTest.testMaxTime-seed#[8E92EFD6C8B062D]) [    x:collection1] 
o.a.s.r.RestManager Initializing 0 registered ManagedResources
   [junit4]   2> 14862 INFO  
(TEST-AutoCommitTest.testMaxTime-seed#[8E92EFD6C8B062D]) [    x:collection1] 
o.a.s.h.c.SpellCheckComponent Initializing spell checkers
   [junit4]   2> 14863 INFO  
(TEST-AutoCommitTest.testMaxTime-seed#[8E92EFD6C8B062D]) [    x:collection1] 
o.a.s.s.DirectSolrSpellChecker init: 
{name=direct,classname=DirectSolrSpellChecker,field=lowerfilt,minQueryLength=3}
   [junit4]   2> 14869 INFO  
(TEST-AutoCommitTest.testMaxTime-seed#[8E92EFD6C8B062D]) [    x:collection1] 
o.a.s.h.ReplicationHandler Commits will be reserved for  10000
   [junit4]   2> 14871 INFO  
(searcherExecutor-25-thread-1-processing-x:collection1) [    x:collection1] 
o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: default
   [junit4]   2> 14871 INFO  
(TEST-AutoCommitTest.testMaxTime-seed#[8E92EFD6C8B062D]) [    x:collection1] 
o.a.s.u.UpdateLog Looking up max value of version field to seed version buckets
   [junit4]   2> 14872 INFO  
(searcherExecutor-25-thread-1-processing-x:collection1) [    x:collection1] 
o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: direct
   [junit4]   2> 14872 INFO  
(searcherExecutor-25-thread-1-processing-x:collection1) [    x:collection1] 
o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: wordbreak
   [junit4]   2> 14872 INFO  
(searcherExecutor-25-thread-1-processing-x:collection1) [    x:collection1] 
o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: 
multipleFields
   [junit4]   2> 14873 INFO  
(searcherExecutor-25-thread-1-processing-x:collection1) [    x:collection1] 
o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: jarowinkler
   [junit4]   2> 14873 INFO  
(searcherExecutor-25-thread-1-processing-x:collection1) [    x:collection1] 
o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: external
   [junit4]   2> 14874 INFO  
(searcherExecutor-25-thread-1-processing-x:collection1) [    x:collection1] 
o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: freq
   [junit4]   2> 14875 INFO  
(searcherExecutor-25-thread-1-processing-x:collection1) [    x:collection1] 
o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: fqcn
   [junit4]   2> 14876 INFO  
(searcherExecutor-25-thread-1-processing-x:collection1) [    x:collection1] 
o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: perDict
   [junit4]   2> 14876 INFO  
(searcherExecutor-25-thread-1-processing-x:collection1) [    x:collection1] 
o.a.s.c.SolrCore [collection1] Registered new searcher 
Searcher@1e2a8087[collection1] 
main{ExitableDirectoryReader(UninvertingDirectoryReader())}
   [junit4]   2> 14880 INFO  
(TEST-AutoCommitTest.testMaxTime-seed#[8E92EFD6C8B062D]) [    x:collection1] 
o.a.s.u.VersionInfo Refreshing highest value of _version_ for 65536 version 
buckets from index
   [junit4]   2> 14880 INFO  
(TEST-AutoCommitTest.testMaxTime-seed#[8E92EFD6C8B062D]) [    x:collection1] 
o.a.s.u.VersionInfo No terms found for _version_, cannot seed version bucket 
highest value from index
   [junit4]   2> 14883 INFO  
(TEST-AutoCommitTest.testMaxTime-seed#[8E92EFD6C8B062D]) [    x:collection1] 
o.a.s.u.UpdateLog Took 11.0ms to seed version buckets with highest version 
1542831446903750656
   [junit4]   2> 14883 INFO  
(TEST-AutoCommitTest.testMaxTime-seed#[8E92EFD6C8B062D]) [    x:collection1] 
o.a.s.u.DefaultSolrCoreState Closing old IndexWriter... core=collection1
   [junit4]   2> 14888 INFO  
(TEST-AutoCommitTest.testMaxTime-seed#[8E92EFD6C8B062D]) [    x:collection1] 
o.a.s.u.RandomMergePolicy RandomMergePolicy wrapping class 
org.apache.lucene.index.AlcoholicMergePolicy: [AlcoholicMergePolicy: 
minMergeSize=0, mergeFactor=10, maxMergeSize=1389142865, 
maxMergeSizeForForcedMerge=9223372036854775807, calibrateSizeByDeletes=true, 
maxMergeDocs=2147483647, maxCFSSegmentSizeMB=8.796093022207999E12, 
noCFSRatio=0.1]
   [junit4]   2> 14890 INFO  
(TEST-AutoCommitTest.testMaxTime-seed#[8E92EFD6C8B062D]) [    x:collection1] 
o.a.s.c.SolrDeletionPolicy SolrDeletionPolicy.onInit: commits: num=1
   [junit4]   2>        commit{dir=MockDirectoryWrapper(RAMDirectory@21eba727 
lockFactory=org.apache.lucene.store.SingleInstanceLockFactory@7eccd918),segFN=segments_1,generation=1}
   [junit4]   2> 14890 INFO  
(TEST-AutoCommitTest.testMaxTime-seed#[8E92EFD6C8B062D]) [    x:collection1] 
o.a.s.c.SolrDeletionPolicy newest commit generation = 1
   [junit4]   2> 14890 INFO  
(TEST-AutoCommitTest.testMaxTime-seed#[8E92EFD6C8B062D]) [    x:collection1] 
o.a.s.u.DefaultSolrCoreState New IndexWriter is ready to be used.
   [junit4]   2> 14890 INFO  
(TEST-AutoCommitTest.testMaxTime-seed#[8E92EFD6C8B062D]) [    x:collection1] 
o.a.s.s.SolrIndexSearcher Opening [Searcher@5b7b7dd[collection1] main]
   [junit4]   2> 14891 INFO  
(TEST-AutoCommitTest.testMaxTime-seed#[8E92EFD6C8B062D]) [    x:collection1] 
o.a.s.c.CoreContainer replacing core: collection1
   [junit4]   2> 14891 INFO  
(TEST-AutoCommitTest.testMaxTime-seed#[8E92EFD6C8B062D]) [    x:collection1] 
o.a.s.c.SolrCore [collection1]  CLOSING SolrCore 
org.apache.solr.core.SolrCore@3eb2fe72
   [junit4]   2> 14891 INFO  
(TEST-AutoCommitTest.testMaxTime-seed#[8E92EFD6C8B062D]) [    x:collection1] 
o.a.s.u.DirectUpdateHandler2 closing 
DirectUpdateHandler2{commits=0,autocommits=0,soft 
autocommits=0,optimizes=0,rollbacks=0,expungeDeletes=0,docsPending=0,adds=0,deletesById=0,deletesByQuery=1,errors=0,cumulative_adds=0,cumulative_deletesById=0,cumulative_deletesByQuery=1,cumulative_errors=0,transaction_logs_total_size=0,transaction_logs_total_number=0}
   [junit4]   2> 14892 INFO  
(TEST-AutoCommitTest.testMaxTime-seed#[8E92EFD6C8B062D]) [    x:collection1] 
o.a.s.c.SolrCore [collection1] Closing main searcher on request.
   [junit4]   2> 14948 INFO  
(searcherExecutor-25-thread-1-processing-x:collection1) [    x:collection1] 
o.a.s.c.SolrCore [collection1] Registered new searcher 
Searcher@5b7b7dd[collection1] 
main{ExitableDirectoryReader(UninvertingDirectoryReader())}
   [junit4]   2> 14958 INFO  
(TEST-AutoCommitTest.testMaxTime-seed#[8E92EFD6C8B062D]) [    x:collection1] 
o.a.s.u.p.LogUpdateProcessorFactory [collection1] {add=[529 
(1542831447425941504)]} 0 46
   [junit4]   2> 14958 INFO  
(TEST-AutoCommitTest.testMaxTime-seed#[8E92EFD6C8B062D]) [    x:collection1] 
o.a.s.c.S.Request [collection1]  webapp=null path=null 
params={q=id:529&qt=standard&start=0&rows=20&version=2.2} hits=0 status=0 
QTime=0
   [junit4]   2> 14961 INFO  
(TEST-AutoCommitTest.testMaxTime-seed#[8E92EFD6C8B062D]) [    x:collection1] 
o.a.s.u.p.LogUpdateProcessorFactory [collection1] {add=[530 
(1542831447477321728)]} 0 50
   [junit4]   2> 14961 INFO  
(TEST-AutoCommitTest.testMaxTime-seed#[8E92EFD6C8B062D]) [    x:collection1] 
o.a.s.c.S.Request [collection1]  webapp=null path=null 
params={q=id:529&qt=standard&start=0&rows=20&version=2.2} hits=0 status=0 
QTime=0
   [junit4]   2> 14962 ERROR 
(TEST-AutoCommitTest.testMaxTime-seed#[8E92EFD6C8B062D]) [    x:collection1] 
o.a.s.SolrTestCaseJ4 REQUEST FAILED: xpath=//result[@numFound=1]
   [junit4]   2>        xml response was: <?xml version="1.0" encoding="UTF-8"?>
   [junit4]   2> <response>
   [junit4]   2> <lst name="responseHeader"><int name="status">0</int><int 
name="QTime">0</int></lst><result name="response" numFound="0" 
start="0"></result>
   [junit4]   2> </response>
   [junit4]   2> 
   [junit4]   2>        request 
was:q=id:529&qt=standard&start=0&rows=20&version=2.2
   [junit4]   2> 14962 ERROR 
(TEST-AutoCommitTest.testMaxTime-seed#[8E92EFD6C8B062D]) [    x:collection1] 
o.a.s.SolrTestCaseJ4 REQUEST FAILED: 
q=id:529&qt=standard&start=0&rows=20&version=2.2:java.lang.RuntimeException: 
REQUEST FAILED: xpath=//result[@numFound=1]
   [junit4]   2>        xml response was: <?xml version="1.0" encoding="UTF-8"?>
   [junit4]   2> <response>
   [junit4]   2> <lst name="responseHeader"><int name="status">0</int><int 
name="QTime">0</int></lst><result name="response" numFound="0" 
start="0"></result>
   [junit4]   2> </response>
   [junit4]   2> 
   [junit4]   2>        request 
was:q=id:529&qt=standard&start=0&rows=20&version=2.2
   [junit4]   2>        at 
org.apache.solr.SolrTestCaseJ4.assertQ(SolrTestCaseJ4.java:775)
   [junit4]   2>        at 
org.apache.solr.update.AutoCommitTest.testMaxTime(AutoCommitTest.java:243)
   [junit4]   2>        at sun.reflect.NativeMethodAccessorImpl.invoke0(Native 
Method)
   [junit4]   2>        at 
sun.reflect.NativeMethodAccessorImpl.invoke(NativeMethodAccessorImpl.java:62)
   [junit4]   2>        at 
sun.reflect.DelegatingMethodAccessorImpl.invoke(DelegatingMethodAccessorImpl.java:43)
   [junit4]   2>        at java.lang.reflect.Method.invoke(Method.java:498)
   [junit4]   2>        at 
com.carrotsearch.randomizedtesting.RandomizedRunner.invoke(RandomizedRunner.java:1764)
   [junit4]   2>        at 
com.carrotsearch.randomizedtesting.RandomizedRunner$8.evaluate(RandomizedRunner.java:871)
   [junit4]   2>        at 
com.carrotsearch.randomizedtesting.RandomizedRunner$9.evaluate(RandomizedRunner.java:907)
   [junit4]   2>        at 
com.carrotsearch.randomizedtesting.RandomizedRunner$10.evaluate(RandomizedRunner.java:921)
   [junit4]   2>        at 
com.carrotsearch.randomizedtesting.rules.SystemPropertiesRestoreRule$1.evaluate(SystemPropertiesRestoreRule.java:57)
   [junit4]   2>        at 
org.apache.lucene.util.TestRuleSetupTeardownChained$1.evaluate(TestRuleSetupTeardownChained.java:49)
   [junit4]   2>        at 
org.apache.lucene.util.AbstractBeforeAfterRule$1.evaluate(AbstractBeforeAfterRule.java:45)
   [junit4]   2>        at 
org.apache.lucene.util.TestRuleThreadAndTestName$1.evaluate(TestRuleThreadAndTestName.java:48)
   [junit4]   2>        at 
org.apache.lucene.util.TestRuleIgnoreAfterMaxFailures$1.evaluate(TestRuleIgnoreAfterMaxFailures.java:64)
   [junit4]   2>        at 
org.apache.lucene.util.TestRuleMarkFailure$1.evaluate(TestRuleMarkFailure.java:47)
   [junit4]   2>        at 
com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
   [junit4]   2>        at 
com.carrotsearch.randomizedtesting.ThreadLeakControl$StatementRunner.run(ThreadLeakControl.java:367)
   [junit4]   2>        at 
com.carrotsearch.randomizedtesting.ThreadLeakControl.forkTimeoutingTask(ThreadLeakControl.java:809)
   [junit4]   2>        at 
com.carrotsearch.randomizedtesting.ThreadLeakControl$3.evaluate(ThreadLeakControl.java:460)
   [junit4]   2>        at 
com.carrotsearch.randomizedtesting.RandomizedRunner.runSingleTest(RandomizedRunner.java:880)
   [junit4]   2>        at 
com.carrotsearch.randomizedtesting.RandomizedRunner$5.evaluate(RandomizedRunner.java:781)
   [junit4]   2>        at 
com.carrotsearch.randomizedtesting.RandomizedRunner$6.evaluate(RandomizedRunner.java:816)
   [junit4]   2>        at 
com.carrotsearch.randomizedtesting.RandomizedRunner$7.evaluate(RandomizedRunner.java:827)
   [junit4]   2>        at 
com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
   [junit4]   2>        at 
com.carrotsearch.randomizedtesting.rules.SystemPropertiesRestoreRule$1.evaluate(SystemPropertiesRestoreRule.java:57)
   [junit4]   2>        at 
org.apache.lucene.util.AbstractBeforeAfterRule$1.evaluate(AbstractBeforeAfterRule.java:45)
   [junit4]   2>        at 
com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
   [junit4]   2>        at 
org.apache.lucene.util.TestRuleStoreClassName$1.evaluate(TestRuleStoreClassName.java:41)
   [junit4]   2>        at 
com.carrotsearch.randomizedtesting.rules.NoShadowingOrOverridesOnMethodsRule$1.evaluate(NoShadowingOrOverridesOnMethodsRule.java:40)
   [junit4]   2>        at 
com.carrotsearch.randomizedtesting.rules.NoShadowingOrOverridesOnMethodsRule$1.evaluate(NoShadowingOrOverridesOnMethodsRule.java:40)
   [junit4]   2>        at 
com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
   [junit4]   2>        at 
com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
   [junit4]   2>        at 
com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
   [junit4]   2>        at 
org.apache.lucene.util.TestRuleAssertionsRequired$1.evaluate(TestRuleAssertionsRequired.java:53)
   [junit4]   2>        at 
org.apache.lucene.util.TestRuleMarkFailure$1.evaluate(TestRuleMarkFailure.java:47)
   [junit4]   2>        at 
org.apache.lucene.util.TestRuleIgnoreAfterMaxFailures$1.evaluate(TestRuleIgnoreAfterMaxFailures.java:64)
   [junit4]   2>        at 
org.apache.lucene.util.TestRuleIgnoreTestSuites$1.evaluate(TestRuleIgnoreTestSuites.java:54)
   [junit4]   2>        at 
com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
   [junit4]   2>        at 
com.carrotsearch.randomizedtesting.ThreadLeakControl$StatementRunner.run(ThreadLeakControl.java:367)
   [junit4]   2>        at java.lang.Thread.run(Thread.java:745)
   [junit4]   2> 
   [junit4]   2> 14963 INFO  
(TEST-AutoCommitTest.testMaxTime-seed#[8E92EFD6C8B062D]) [    x:collection1] 
o.a.s.SolrTestCaseJ4 ###Ending testMaxTime
   [junit4]   2> NOTE: reproduce with: ant test  -Dtestcase=AutoCommitTest 
-Dtests.method=testMaxTime -Dtests.seed=8E92EFD6C8B062D -Dtests.slow=true 
-Dtests.locale=nl-NL -Dtests.timezone=Asia/Barnaul -Dtests.asserts=true 
-Dtests.file.encoding=ISO-8859-1
   [junit4] ERROR   0.60s J1 | AutoCommitTest.testMaxTime <<<
   [junit4]    > Throwable #1: java.lang.RuntimeException: Exception during 
query
   [junit4]    >        at 
__randomizedtesting.SeedInfo.seed([8E92EFD6C8B062D:921D531FF2119A11]:0)
   [junit4]    >        at 
org.apache.solr.SolrTestCaseJ4.assertQ(SolrTestCaseJ4.java:782)
   [junit4]    >        at 
org.apache.solr.update.AutoCommitTest.testMaxTime(AutoCommitTest.java:243)
   [junit4]    >        at java.lang.Thread.run(Thread.java:745)
   [junit4]    > Caused by: java.lang.RuntimeException: REQUEST FAILED: 
xpath=//result[@numFound=1]
   [junit4]    >        xml response was: <?xml version="1.0" encoding="UTF-8"?>
   [junit4]    > <response>
   [junit4]    > <lst name="responseHeader"><int name="status">0</int><int 
name="QTime">0</int></lst><result name="response" numFound="0" 
start="0"></result>
   [junit4]    > </response>
   [junit4]    >        request 
was:q=id:529&qt=standard&start=0&rows=20&version=2.2
   [junit4]    >        at 
org.apache.solr.SolrTestCaseJ4.assertQ(SolrTestCaseJ4.java:775)
   [junit4]    >        ... 40 more
   [junit4]   2> 15014 INFO  
(TEST-AutoCommitTest.testMaxDocs-seed#[8E92EFD6C8B062D]) [    x:collection1] 
o.a.s.SolrTestCaseJ4 ###Starting testMaxDocs
   [junit4]   2> 15134 INFO  
(TEST-AutoCommitTest.testMaxDocs-seed#[8E92EFD6C8B062D]) [    x:collection1] 
o.a.s.s.SolrIndexSearcher Opening [Searcher@3c93948a[collection1] realtime]
   [junit4]   2> 15134 INFO  
(TEST-AutoCommitTest.testMaxDocs-seed#[8E92EFD6C8B062D]) [    x:collection1] 
o.a.s.u.p.LogUpdateProcessorFactory [collection1]  webapp=null path=null 
params={}{deleteByQuery=*:* (-1542831447533944832)} 0 120
   [junit4]   2> 15136 INFO  
(TEST-AutoCommitTest.testMaxDocs-seed#[8E92EFD6C8B062D]) [    x:collection1] 
o.a.s.c.SolrResourceLoader new SolrResourceLoader for directory: 
'/export/home/jenkins/workspace/Lucene-Solr-master-Solaris/solr/core/src/test-files/solr/collection1'
   [junit4]   2> 15137 INFO  
(TEST-AutoCommitTest.testMaxDocs-seed#[8E92EFD6C8B062D]) [    x:collection1] 
o.a.s.c.SolrResourceLoader JNDI not configured for solr (NoInitialContextEx)
   [junit4]   2> 15137 INFO  
(TEST-AutoCommitTest.testMaxDocs-seed#[8E92EFD6C8B062D]) [    x:collection1] 
o.a.s.c.SolrResourceLoader using system property solr.solr.home: 
/export/home/jenkins/workspace/Lucene-Solr-master-Solaris/solr/core/src/test-files/solr
   [junit4]   2> 15137 INFO  
(TEST-AutoCommitTest.testMaxDocs-seed#[8E92EFD6C8B062D]) [    x:collection1] 
o.a.s.c.SolrResourceLoader Adding 
'file:/export/home/jenkins/workspace/Lucene-Solr-master-Solaris/solr/core/src/test-files/solr/collection1/lib/classes/'
 to classloader
   [junit4]   2> 15137 INFO  
(TEST-AutoCommitTest.testMaxDocs-seed#[8E92EFD6C8B062D]) [    x:collection1] 
o.a.s.c.SolrResourceLoader Adding 
'file:/export/home/jenkins/workspace/Lucene-Solr-master-Solaris/solr/core/src/test-files/solr/collection1/lib/README'
 to classloader
   [junit4]   2> 15209 INFO  
(TEST-AutoCommitTest.testMaxDocs-seed#[8E92EFD6C8B062D]) [    x:collection1] 
o.a.s.c.SolrConfig current version of requestparams : -1
   [junit4]   2> 15220 WARN  
(TEST-AutoCommitTest.testMaxDocs-seed#[8E92EFD6C8B062D]) [    x:collection1] 
o.a.s.c.Config Beginning with Solr 5.5, <mergePolicy> is deprecated, use 
<mergePolicyFactory> instead.
   [junit4]   2> 15222 INFO  
(TEST-AutoCommitTest.testMaxDocs-seed#[8E92EFD6C8B062D]) [    x:collection1] 
o.a.s.c.SolrConfig Using Lucene MatchVersion: 7.0.0
   [junit4]   2> 15246 INFO  
(TEST-AutoCommitTest.testMaxDocs-seed#[8E92EFD6C8B062D]) [    x:collection1] 
o.a.s.c.SolrConfig Loaded SolrConfig: solrconfig.xml
   [junit4]   2> 15262 INFO  
(TEST-AutoCommitTest.testMaxDocs-seed#[8E92EFD6C8B062D]) [    x:collection1] 
o.a.s.s.IndexSchema [collection1] Schema name=test
   [junit4]   2> 15430 INFO  
(TEST-AutoCommitTest.testMaxDocs-seed#[8E92EFD6C8B062D]) [    x:collection1] 
o.a.s.s.OpenExchangeRatesOrgProvider Initialized with 
rates=open-exchange-rates.json, refreshInterval=1440.
   [junit4]   2> 15440 INFO  
(TEST-AutoCommitTest.testMaxDocs-seed#[8E92EFD6C8B062D]) [    x:collection1] 
o.a.s.s.IndexSchema default search field in schema is text
   [junit4]   2> 15441 INFO  
(TEST-AutoCommitTest.testMaxDocs-seed#[8E92EFD6C8B062D]) [    x:collection1] 
o.a.s.s.IndexSchema unique key field: id
   [junit4]   2> 15447 INFO  
(TEST-AutoCommitTest.testMaxDocs-seed#[8E92EFD6C8B062D]) [    x:collection1] 
o.a.s.s.FileExchangeRateProvider Reloading exchange rates from file currency.xml
   [junit4]   2> 15450 INFO  
(TEST-AutoCommitTest.testMaxDocs-seed#[8E92EFD6C8B062D]) [    x:collection1] 
o.a.s.s.FileExchangeRateProvider Reloading exchange rates from file currency.xml
   [junit4]   2> 15453 INFO  
(TEST-AutoCommitTest.testMaxDocs-seed#[8E92EFD6C8B062D]) [    x:collection1] 
o.a.s.s.OpenExchangeRatesOrgProvider Reloading exchange rates from 
open-exchange-rates.json
   [junit4]   2> 15454 INFO  
(TEST-AutoCommitTest.testMaxDocs-seed#[8E92EFD6C8B062D]) [    x:collection1] 
o.a.s.s.OpenExchangeRatesOrgProvider Reloading exchange rates from 
open-exchange-rates.json
   [junit4]   2> 15456 INFO  
(TEST-AutoCommitTest.testMaxDocs-seed#[8E92EFD6C8B062D]) [    x:collection1] 
o.a.s.c.ConfigSetProperties Did not find ConfigSet properties, assuming default 
properties: Can't find resource 'configsetprops.json' in classpath or 
'/export/home/jenkins/workspace/Lucene-Solr-master-Solaris/solr/core/src/test-files/solr/collection1'
   [junit4]   2> 15456 INFO  
(TEST-AutoCommitTest.testMaxDocs-seed#[8E92EFD6C8B062D]) [    x:collection1] 
o.a.s.c.CoreContainer Reloading SolrCore 'collection1' using configuration from 
instancedir 
/export/home/jenkins/workspace/Lucene-Solr-master-Solaris/solr/core/src/test-files/solr/collection1
   [junit4]   2> 15457 INFO  
(TEST-AutoCommitTest.testMaxDocs-seed#[8E92EFD6C8B062D]) [    x:collection1] 
o.a.s.c.SolrCore [[collection1] ] Opening new SolrCore at 
[/export/home/jenkins/workspace/Lucene-Solr-master-Solaris/solr/core/src/test-files/solr/collection1],
 
dataDir=[/export/home/jenkins/workspace/Lucene-Solr-master-Solaris/solr/build/solr-core/test/J1/temp/solr.update.AutoCommitTest_8E92EFD6C8B062D-001/init-core-data-001/]
   [junit4]   2> 15457 INFO  
(TEST-AutoCommitTest.testMaxDocs-seed#[8E92EFD6C8B062D]) [    x:collection1] 
o.a.s.c.JmxMonitoredMap No JMX servers found, not exposing Solr information 
with JMX.
   [junit4]   2> 15457 INFO  
(TEST-AutoCommitTest.testMaxDocs-seed#[8E92EFD6C8B062D]) [    x:collection1] 
o.a.s.c.s.SolrSnapshotMetaDataManager Loading from snapshot metadata file...
   [junit4]   2> 15457 INFO  
(TEST-AutoCommitTest.testMaxDocs-seed#[8E92EFD6C8B062D]) [    x:collection1] 
o.a.s.c.SolrCore New index directory detected: old=null 
new=/export/home/jenkins/workspace/Lucene-Solr-master-Solaris/solr/build/solr-core/test/J1/temp/solr.update.AutoCommitTest_8E92EFD6C8B062D-001/init-core-data-001/index/
   [junit4]   2> 15457 INFO  
(OldIndexDirectoryCleanupThreadForCore-collection1) [    x:collection1] 
o.a.s.c.SolrCore Looking for old index directories to cleanup for core 
collection1 in 
/export/home/jenkins/workspace/Lucene-Solr-master-Solaris/solr/build/solr-core/test/J1/temp/solr.update.AutoCommitTest_8E92EFD6C8B062D-001/init-core-data-001/
   [junit4]   2> 15463 INFO  
(TEST-AutoCommitTest.testMaxDocs-seed#[8E92EFD6C8B062D]) [    x:collection1] 
o.a.s.u.p.UpdateRequestProcessorChain creating updateRequestProcessorChain 
"dedupe"
   [junit4]   2> 15463 INFO  
(TEST-AutoCommitTest.testMaxDocs-seed#[8E92EFD6C8B062D]) [    x:collection1] 
o.a.s.u.p.UpdateRequestProcessorChain inserting 
DistributedUpdateProcessorFactory into updateRequestProcessorChain "dedupe"
   [junit4]   2> 15463 INFO  
(TEST-AutoCommitTest.testMaxDocs-seed#[8E92EFD6C8B062D]) [    x:collection1] 
o.a.s.u.p.UpdateRequestProcessorChain creating updateRequestProcessorChain 
"dedupe-allfields"
   [junit4]   2> 15464 INFO  
(TEST-AutoCommitTest.testMaxDocs-seed#[8E92EFD6C8B062D]) [    x:collection1] 
o.a.s.u.p.UpdateRequestProcessorChain inserting 
DistributedUpdateProcessorFactory into updateRequestProcessorChain 
"dedupe-allfields"
   [junit4]   2> 15464 INFO  
(TEST-AutoCommitTest.testMaxDocs-seed#[8E92EFD6C8B062D]) [    x:collection1] 
o.a.s.u.p.UpdateRequestProcessorChain creating updateRequestProcessorChain 
"stored_sig"
   [junit4]   2> 15464 INFO  
(TEST-AutoCommitTest.testMaxDocs-seed#[8E92EFD6C8B062D]) [    x:collection1] 
o.a.s.u.p.UpdateRequestProcessorChain inserting 
DistributedUpdateProcessorFactory into updateRequestProcessorChain "stored_sig"
   [junit4]   2> 15464 INFO  
(TEST-AutoCommitTest.testMaxDocs-seed#[8E92EFD6C8B062D]) [    x:collection1] 
o.a.s.u.p.UpdateRequestProcessorChain creating updateRequestProcessorChain 
"uniq-fields"
   [junit4]   2> 15464 INFO  
(TEST-AutoCommitTest.testMaxDocs-seed#[8E92EFD6C8B062D]) [    x:collection1] 
o.a.s.u.p.UpdateRequestProcessorChain inserting 
DistributedUpdateProcessorFactory into updateRequestProcessorChain "uniq-fields"
   [junit4]   2> 15464 INFO  
(TEST-AutoCommitTest.testMaxDocs-seed#[8E92EFD6C8B062D]) [    x:collection1] 
o.a.s.u.p.UpdateRequestProcessorChain creating updateRequestProcessorChain 
"distrib-dup-test-chain-explicit"
   [junit4]   2> 15464 INFO  
(TEST-AutoCommitTest.testMaxDocs-seed#[8E92EFD6C8B062D]) [    x:collection1] 
o.a.s.u.p.UpdateRequestProcessorChain creating updateRequestProcessorChain 
"distrib-dup-test-chain-implicit"
   [junit4]   2> 15465 INFO  
(TEST-AutoCommitTest.testMaxDocs-seed#[8E92EFD6C8B062D]) [    x:collection1] 
o.a.s.u.p.UpdateRequestProcessorChain inserting 
DistributedUpdateProcessorFactory into updateRequestProcessorChain 
"distrib-dup-test-chain-implicit"
   [junit4]   2> 15465 INFO  
(TEST-AutoCommitTest.testMaxDocs-seed#[8E92EFD6C8B062D]) [    x:collection1] 
o.a.s.c.SolrCore no updateRequestProcessorChain defined as default, creating 
implicit default
   [junit4]   2> 15473 INFO  
(TEST-AutoCommitTest.testMaxDocs-seed#[8E92EFD6C8B062D]) [    x:collection1] 
o.a.s.h.l.XMLLoader xsltCacheLifetimeSeconds=60
   [junit4]   2> 15474 INFO  
(TEST-AutoCommitTest.testMaxDocs-seed#[8E92EFD6C8B062D]) [    x:collection1] 
o.a.s.h.l.XMLLoader xsltCacheLifetimeSeconds=60
   [junit4]   2> 15475 INFO  
(TEST-AutoCommitTest.testMaxDocs-seed#[8E92EFD6C8B062D]) [    x:collection1] 
o.a.s.h.l.XMLLoader xsltCacheLifetimeSeconds=60
   [junit4]   2> 15480 INFO  
(TEST-AutoCommitTest.testMaxDocs-seed#[8E92EFD6C8B062D]) [    x:collection1] 
o.a.s.h.l.XMLLoader xsltCacheLifetimeSeconds=60
   [junit4]   2> 15484 INFO  
(TEST-AutoCommitTest.testMaxDocs-seed#[8E92EFD6C8B062D]) [    x:collection1] 
o.a.s.c.PluginBag requestHandler : 'lazy' created with startup=lazy 
   [junit4]   2> 15486 INFO  
(TEST-AutoCommitTest.testMaxDocs-seed#[8E92EFD6C8B062D]) [    x:collection1] 
o.a.s.c.RequestHandlers Registered paths: 
/admin/mbeans,standard,spellCheckCompRH,lazy,/update/json/docs,/admin/luke,/export,spellCheckWithWordbreak_Direct,tvrh,/get,/admin/properties,/update/json,mltrh,/admin/threads,/search-facet-def,/update/csv,/sql,/graph,/search-facet-invariants,/admin/segments,spellCheckCompRH1,/mlt,/admin/system,/replication,dismax,defaults,/config,/stream,/schema,/admin/plugins,/admin/logging,spellCheckWithWordbreak,mock,/admin/ping,/update,/admin/file,/terms,spellCheckCompRH_Direct,/debug/dump
   [junit4]   2> 15486 INFO  
(TEST-AutoCommitTest.testMaxDocs-seed#[8E92EFD6C8B062D]) [    x:collection1] 
o.a.s.c.SolrCore Using default statsCache cache: 
org.apache.solr.search.stats.LocalStatsCache
   [junit4]   2> 15486 INFO  
(TEST-AutoCommitTest.testMaxDocs-seed#[8E92EFD6C8B062D]) [    x:collection1] 
o.a.s.u.CommitTracker Hard AutoCommit: disabled
   [junit4]   2> 15486 INFO  
(TEST-AutoCommitTest.testMaxDocs-seed#[8E92EFD6C8B062D]) [    x:collection1] 
o.a.s.u.CommitTracker Soft AutoCommit: disabled
   [junit4]   2> 15487 INFO  
(TEST-AutoCommitTest.testMaxDocs-seed#[8E92EFD6C8B062D]) [    x:collection1] 
o.a.s.s.SolrIndexSearcher Opening [Searcher@322ebd04[collection1] main]
   [junit4]   2> 15488 INFO  
(TEST-AutoCommitTest.testMaxDocs-seed#[8E92EFD6C8B062D]) [    x:collection1] 
o.a.s.r.RestManager Initializing RestManager with initArgs: 
{storageIO=org.apache.solr.rest.ManagedResourceStorage$InMemoryStorageIO}
   [junit4]   2> 15488 INFO  
(TEST-AutoCommitTest.testMaxDocs-seed#[8E92EFD6C8B062D]) [    x:collection1] 
o.a.s.r.ManagedResourceStorage Reading _rest_managed.json using InMemoryStorage
   [junit4]   2> 15488 INFO  
(TEST-AutoCommitTest.testMaxDocs-seed#[8E92EFD6C8B062D]) [    x:collection1] 
o.a.s.r.RestManager Initializing 0 registered ManagedResources
   [junit4]   2> 15488 INFO  
(TEST-AutoCommitTest.testMaxDocs-seed#[8E92EFD6C8B062D]) [    x:collection1] 
o.a.s.h.c.SpellCheckComponent Initializing spell checkers
   [junit4]   2> 15494 INFO  
(TEST-AutoCommitTest.testMaxDocs-seed#[8E92EFD6C8B062D]) [    x:collection1] 
o.a.s.s.DirectSolrSpellChecker init: 
{name=direct,classname=DirectSolrSpellChecker,field=lowerfilt,minQueryLength=3}
   [junit4]   2> 15500 INFO  
(TEST-AutoCommitTest.testMaxDocs-seed#[8E92EFD6C8B062D]) [    x:collection1] 
o.a.s.h.ReplicationHandler Commits will be reserved for  10000
   [junit4]   2> 15501 INFO  
(searcherExecutor-29-thread-1-processing-x:collection1) [    x:collection1] 
o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: default
   [junit4]   2> 15501 INFO  
(TEST-AutoCommitTest.testMaxDocs-seed#[8E92EFD6C8B062D]) [    x:collection1] 
o.a.s.u.UpdateLog Looking up max value of version field to seed version buckets
   [junit4]   2> 15502 INFO  
(TEST-AutoCommitTest.testMaxDocs-seed#[8E92EFD6C8B062D]) [    x:collection1] 
o.a.s.u.VersionInfo Refreshing highest value of _version_ for 65536 version 
buckets from index
   [junit4]   2> 15502 INFO  
(TEST-AutoCommitTest.testMaxDocs-seed#[8E92EFD6C8B062D]) [    x:collection1] 
o.a.s.u.VersionInfo No terms found for _version_, cannot seed version bucket 
highest value from index
   [junit4]   2> 15502 INFO  
(searcherExecutor-29-thread-1-processing-x:collection1) [    x:collection1] 
o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: direct
   [junit4]   2> 15502 INFO  
(searcherExecutor-29-thread-1-processing-x:collection1) [    x:collection1] 
o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: wordbreak
   [junit4]   2> 15502 INFO  
(searcherExecutor-29-thread-1-processing-x:collection1) [    x:collection1] 
o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: 
multipleFields
   [junit4]   2> 15503 INFO  
(TEST-AutoCommitTest.testMaxDocs-seed#[8E92EFD6C8B062D]) [    x:collection1] 
o.a.s.u.UpdateLog Took 1.0ms to seed version buckets with highest version 
1542831447533944832
   [junit4]   2> 15503 INFO  
(searcherExecutor-29-thread-1-processing-x:collection1) [    x:collection1] 
o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: jarowinkler
   [junit4]   2> 15503 INFO  
(TEST-AutoCommitTest.testMaxDocs-seed#[8E92EFD6C8B062D]) [    x:collection1] 
o.a.s.u.DefaultSolrCoreState Closing old IndexWriter... core=collection1
   [junit4]   2> 15503 INFO  
(searcherExecutor-29-thread-1-processing-x:collection1) [    x:collection1] 
o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: external
   [junit4]   2> 15504 INFO  
(TEST-AutoCommitTest.testMaxDocs-seed#[8E92EFD6C8B062D]) [    x:collection1] 
o.a.s.c.SolrDeletionPolicy SolrDeletionPolicy.onCommit: commits: num=2
   [junit4]   2>        commit{dir=MockDirectoryWrapper(RAMDirectory@21eba727 
lockFactory=org.apache.lucene.store.SingleInstanceLockFactory@7eccd918),segFN=segments_1,generation=1}
   [junit4]   2>        commit{dir=MockDirectoryWrapper(RAMDirectory@21eba727 
lockFactory=org.apache.lucene.store.SingleInstanceLockFactory@7eccd918),segFN=segments_2,generation=2}
   [junit4]   2> 15504 INFO  
(TEST-AutoCommitTest.testMaxDocs-seed#[8E92EFD6C8B062D]) [    x:collection1] 
o.a.s.c.SolrDeletionPolicy newest commit generation = 2
   [junit4]   2> 15505 INFO  
(TEST-AutoCommitTest.testMaxDocs-seed#[8E92EFD6C8B062D]) [    x:collection1] 
o.a.s.u.RandomMergePolicy RandomMergePolicy wrapping class 
org.apache.lucene.index.LogDocMergePolicy: [LogDocMergePolicy: 
minMergeSize=1000, mergeFactor=43, maxMergeSize=9223372036854775807, 
maxMergeSizeForForcedMerge=9223372036854775807, calibrateSizeByDeletes=false, 
maxMergeDocs=2147483647, maxCFSSegmentSizeMB=8.796093022207999E12, 
noCFSRatio=1.0]
   [junit4]   2> 15505 INFO  
(TEST-AutoCommitTest.testMaxDocs-seed#[8E92EFD6C8B062D]) [    x:collection1] 
o.a.s.c.SolrDeletionPolicy SolrDeletionPolicy.onInit: commits: num=1
   [junit4]   2>        commit{dir=MockDirectoryWrapper(RAMDirectory@21eba727 
lockFactory=org.apache.lucene.store.SingleInstanceLockFactory@7eccd918),segFN=segments_2,generation=2}
   [junit4]   2> 15506 INFO  
(TEST-AutoCommitTest.testMaxDocs-seed#[8E92EFD6C8B062D]) [    x:collection1] 
o.a.s.c.SolrDeletionPolicy newest commit generation = 2
   [junit4]   2> 15506 INFO  
(TEST-AutoCommitTest.testMaxDocs-seed#[8E92EFD6C8B062D]) [    x:collection1] 
o.a.s.u.DefaultSolrCoreState New IndexWriter is ready to be used.
   [junit4]   2> 15506 WARN  
(TEST-AutoCommitTest.testMaxDocs-seed#[8E92EFD6C8B062D]) [    x:collection1] 
o.a.s.c.SolrCore [collection1] PERFORMANCE WARNING: Overlapping 
onDeckSearchers=2
   [junit4]   2> 15506 INFO  
(TEST-AutoCommitTest.testMaxDocs-seed#[8E92EFD6C8B062D]) [    x:collection1] 
o.a.s.s.SolrIndexSearcher Opening [Searcher@51ac8e36[collection1] main]
   [junit4]   2> 15506 INFO  
(TEST-AutoCommitTest.testMaxDocs-seed#[8E92EFD6C8B062D]) [    x:collection1] 
o.a.s.c.CoreContainer replacing core: collection1
   [junit4]   2> 15506 INFO  
(TEST-AutoCommitTest.testMaxDocs-seed#[8E92EFD6C8B062D]) [    x:collection1] 
o.a.s.c.SolrCore [collection1]  CLOSING SolrCore 
org.apache.solr.core.SolrCore@3def0346
   [junit4]   2> 15506 INFO  
(TEST-AutoCommitTest.testMaxDocs-seed#[8E92EFD6C8B062D]) [    x:collection1] 
o.a.s.u.DirectUpdateHandler2 closing 
DirectUpdateHandler2{commits=0,autocommits=0,soft autocommit 
maxTime=1000ms,soft 
autocommits=0,optimizes=0,rollbacks=0,expungeDeletes=0,docsPending=2,adds=2,deletesById=0,deletesByQuery=1,errors=0,cumulative_adds=2,cumulative_deletesById=0,cumulative_deletesByQuery=1,cumulative_errors=0,transaction_logs_total_size=0,transaction_logs_total_number=0}
   [junit4]   2> 15507 INFO  
(searcherExecutor-29-thread-1-processing-x:collection1) [    x:collection1] 
o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: freq
   [junit4]   2> 15507 INFO  
(TEST-AutoCommitTest.testMaxDocs-seed#[8E92EFD6C8B062D]) [    x:collection1] 
o.a.s.c.SolrCore [collection1] Closing main searcher on request.
   [junit4]   2> 15511 INFO  
(TEST-AutoCommitTest.testMaxDocs-seed#[8E92EFD6C8B062D]) [    x:collection1] 
o.a.s.u.p.LogUpdateProcessorFactory [collection1] {add=[0 
(1542831448054038528)]} 0 0
   [junit4]   2> 15511 INFO  
(TEST-AutoCommitTest.testMaxDocs-seed#[8E92EFD6C8B062D]) [    x:collection1] 
o.a.s.u.p.LogUpdateProcessorFactory [collection1] {add=[1 
(1542831448055087104)]} 0 1
   [junit4]   2> 15512 INFO  
(TEST-AutoCommitTest.testMaxDocs-seed#[8E92EFD6C8B062D]) [    x:collection1] 
o.a.s.u.p.LogUpdateProcessorFactory [collection1] {add=[2 
(1542831448056135680)]} 0 2
   [junit4]   2> 15513 INFO  
(TEST-AutoCommitTest.testMaxDocs-seed#[8E92EFD6C8B062D]) [    x:collection1] 
o.a.s.u.p.LogUpdateProcessorFactory [collection1] {add=[3 
(1542831448057184256)]} 0 3
   [junit4]   2> 15513 INFO  
(TEST-AutoCommitTest.testMaxDocs-seed#[8E92EFD6C8B062D]) [    x:collection1] 
o.a.s.u.p.LogUpdateProcessorFactory [collection1] {add=[4 
(1542831448057184257)]} 0 3
   [junit4]   2> 15514 INFO  
(TEST-AutoCommitTest.testMaxDocs-seed#[8E92EFD6C8B062D]) [    x:collection1] 
o.a.s.u.p.LogUpdateProcessorFactory [collection1] {add=[5 
(1542831448057184258)]} 0 4
   [junit4]   2> 15514 INFO  
(TEST-AutoCommitTest.testMaxDocs-seed#[8E92EFD6C8B062D]) [    x:collection1] 
o.a.s.u.p.LogUpdateProcessorFactory [collection1] {add=[6 
(1542831448058232832)]} 0 4
   [junit4]   2> 15515 INFO  
(TEST-AutoCommitTest.testMaxDocs-seed#[8E92EFD6C8B062D]) [    x:collection1] 
o.a.s.u.p.LogUpdateProcessorFactory [collection1] {add=[7 
(1542831448058232833)]} 0 4
   [junit4]   2> 15516 INFO  
(TEST-AutoCommitTest.testMaxDocs-seed#[8E92EFD6C8B062D]) [    x:collection1] 
o.a.s.u.p.LogUpdateProcessorFactory [collection1] {add=[8 
(1542831448059281408)]} 0 6
   [junit4]   2> 15516 INFO  
(TEST-AutoCommitTest.testMaxDocs-seed#[8E92EFD6C8B062D]) [    x:collection1] 
o.a.s.u.p.LogUpdateProcessorFactory [collection1] {add=[9 
(1542831448060329984)]} 0 6
   [junit4]   2> 15517 INFO  
(TEST-AutoCommitTest.testMaxDocs-seed#[8E92EFD6C8B062D]) [    x:collection1] 
o.a.s.u.p.LogUpdateProcessorFactory [collection1] {add=[10 
(1542831448060329985)]} 0 6
   [junit4]   2> 15517 INFO  
(TEST-AutoCommitTest.testMaxDocs-seed#[8E92EFD6C8B062D]) [    x:collection1] 
o.a.s.u.p.LogUpdateProcessorFactory [collection1] {add=[11 
(1542831448061378560)]} 0 7
   [junit4]   2> 15517 INFO  
(TEST-AutoCommitTest.testMaxDocs-seed#[8E92EFD6C8B062D]) [    x:collection1] 
o.a.s.u.p.LogUpdateProcessorFactory [collection1] {add=[12 
(1542831448061378561)]} 0 7
   [junit4]   2> 15520 INFO  
(TEST-AutoCommitTest.testMaxDocs-seed#[8E92EFD6C8B062D]) [    x:collection1] 
o.a.s.u.p.LogUpdateProcessorFactory [collection1] {add=[13 
(1542831448061378562)]} 0 10
   [junit4]   2> 15520 INFO  
(searcherExecutor-29-thread-1-processing-x:collection1) [    x:collection1] 
o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: fqcn
   [junit4]   2> 15521 INFO  
(searcherExecutor-29-thread-1-processing-x:collection1) [    x:collection1] 
o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: perDict
   [junit4]   2> 15521 INFO  
(searcherExecutor-29-thread-1-processing-x:collection1) [    x:collection1] 
o.a.s.c.SolrCore [collection1] Registered new searcher 
Searcher@322ebd04[collection1] 
main{ExitableDirectoryReader(UninvertingDirectoryReader())}
   [junit4]   2> 15521 INFO  
(searcherExecutor-29-thread-1-processing-x:collection1) [    x:collection1] 
o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: default
   [junit4]   2> 15521 INFO  
(TEST-AutoCommitTest.testMaxDocs-seed#[8E92EFD6C8B062D]) [    x:collection1] 
o.a.s.c.S.Request [collection1]  webapp=null path=null 
params={q=id:1&qt=standard&start=0&rows=20&version=2.2} hits=0 status=0 QTime=0
   [junit4]   2> 15521 INFO  
(searcherExecutor-29-thread-1-processing-x:collection1) [    x:collection1] 
o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: direct
   [junit4]   2> 15521 INFO  
(searcherExecutor-29-thread-1-processing-x:collection1) [    x:collection1] 
o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: wordbreak
   [junit4]   2> 15521 INFO  
(searcherExecutor-29-thread-1-processing-x:collection1) [    x:collection1] 
o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: 
multipleFields
   [junit4]   2> 15522 INFO  
(searcherExecutor-29-thread-1-processing-x:collection1) [    x:collection1] 
o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: jarowinkler
   [junit4]   2> 15522 INFO  
(searcherExecutor-29-thread-1-processing-x:collection1) [    x:collection1] 
o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: external
   [junit4]   2> 15523 INFO  
(searcherExecutor-29-thread-1-processing-x:collection1) [    x:collection1] 
o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: freq
   [junit4]   2> 15523 INFO  
(searcherExecutor-29-thread-1-processing-x:collection1) [    x:collection1] 
o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: fqcn
   [junit4]   2> 15524 INFO  
(searcherExecutor-29-thread-1-processing-x:collection1) [    x:collection1] 
o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: perDict
   [junit4]   2> 15524 INFO  
(searcherExecutor-29-thread-1-processing-x:collection1) [    x:collection1] 
o.a.s.c.SolrCore [collection1] Registered new searcher 
Searcher@51ac8e36[collection1] 
main{ExitableDirectoryReader(UninvertingDirectoryReader())}
   [junit4]   2> 15529 INFO  
(TEST-AutoCommitTest.testMaxDocs-seed#[8E92EFD6C8B062D]) [    x:collection1] 
o.a.s.u.p.LogUpdateProcessorFactory [collection1] {add=[14 
(1542831448069767168)]} 0 19
   [junit4]   2> 15531 INFO  (commitScheduler-32-thread-1) [    x:collection1] 
o.a.s.u.DirectUpdateHandler2 start 
commit{,optimize=false,openSearcher=true,waitSearcher=true,expungeDeletes=false,softCommit=true,prepareCommit=false}
   [junit4]   2> 15545 INFO  (commitScheduler-32-thread-1) [    x:collection1] 
o.a.s.s.SolrIndexSearcher Opening [Searcher@7a0ef29b[collection1] main]
   [junit4]   2> 15546 INFO  (commitScheduler-32-thread-1) [    x:collection1] 
o.a.s.u.DirectUpdateHandler2 end_commit_flush
   [junit4]   2> 15546 INFO  
(searcherExecutor-29-thread-1-processing-x:collection1) [    x:collection1] 
o.a.s.c.SolrCore [collection1] Registered new searcher 
Searcher@7a0ef29b[collection1] 
main{ExitableDirectoryReader(UninvertingDirectoryReader(Uninverting(_1(7.0.0):c15)))}
   [junit4]   2> 15797 INFO  
(TEST-AutoCommitTest.testMaxDocs-seed#[8E92EFD6C8B062D]) [    x:collection1] 
o.a.s.u.p.LogUpdateProcessorFactory [collection1] {add=[15 
(1542831448353931264)]} 0 287
   [junit4]   2> 15799 INFO  
(TEST-AutoCommitTest.testMaxDocs-seed#[8E92EFD6C8B062D]) [    x:collection1] 
o.a.s.c.S.Request [collection1]  webapp=null path=null 
params={q=id:14&qt=standard&start=0&rows=20&version=2.2} hits=1 status=0 QTime=1
   [junit4]   2> 15807 INFO  
(TEST-AutoCommitTest.testMaxDocs-seed#[8E92EFD6C8B062D]) [    x:collection1] 
o.a.s.c.S.Request [collection1]  webapp=null path=null 
params={q=id:15&qt=standard&start=0&rows=20&version=2.2} hits=0 status=0 QTime=0
   [junit4]   2> 15808 INFO  
(TEST-AutoCommitTest.testMaxDocs-seed#[8E92EFD6C8B062D]) [    x:collection1] 
o.a.s.SolrTestCaseJ4 ###Ending testMaxDocs
   [junit4]   2> 15811 INFO  
(TEST-AutoCommitTest.testCommitWithin-seed#[8E92EFD6C8B062D]) [    
x:collection1] o.a.s.SolrTestCaseJ4 ###Starting testCommitWithin
   [junit4]   2> 15831 INFO  
(TEST-AutoCommitTest.testCommitWithin-seed#[8E92EFD6C8B062D]) [    
x:collection1] o.a.s.s.SolrIndexSearcher Opening 
[Searcher@54c7fde9[collection1] realtime]
   [junit4]   2> 15832 INFO  
(TEST-AutoCommitTest.testCommitWithin-seed#[8E92EFD6C8B062D]) [    
x:collection1] o.a.s.u.p.LogUpdateProcessorFactory [collection1]  webapp=null 
path=null params={}{deleteByQuery=*:* (-1542831448370708480)} 0 20
   [junit4]   2> 15834 INFO  
(TEST-AutoCommitTest.testCommitWithin-seed#[8E92EFD6C8B062D]) [    
x:collection1] o.a.s.c.SolrResourceLoader new SolrResourceLoader for directory: 
'/export/home/jenkins/workspace/Lucene-Solr-master-Solaris/solr/core/src/test-files/solr/collection1'
   [junit4]   2> 15834 INFO  
(TEST-AutoCommitTest.testCommitWithin-seed#[8E92EFD6C8B062D]) [    
x:collection1] o.a.s.c.SolrResourceLoader JNDI not configured for solr 
(NoInitialContextEx)
   [junit4]   2> 15834 INFO  
(TEST-AutoCommitTest.testCommitWithin-seed#[8E92EFD6C8B062D]) [    
x:collection1] o.a.s.c.SolrResourceLoader using system property solr.solr.home: 
/export/home/jenkins/workspace/Lucene-Solr-master-Solaris/solr/core/src/test-files/solr
   [junit4]   2> 15834 INFO  
(TEST-AutoCommitTest.testCommitWithin-seed#[8E92EFD6C8B062D]) [    
x:collection1] o.a.s.c.SolrResourceLoader Adding 
'file:/export/home/jenkins/workspace/Lucene-Solr-master-Solaris/solr/core/src/test-files/solr/collection1/lib/classes/'
 to classloader
   [junit4]   2> 15834 INFO  
(TEST-AutoCommitTest.testCommitWithin-seed#[8E92EFD6C8B062D]) [    
x:collection1] o.a.s.c.SolrResourceLoader Adding 
'file:/export/home/jenkins/workspace/Lucene-Solr-master-Solaris/solr/core/src/test-files/solr/collection1/lib/README'
 to classloader
   [junit4]   2> 15874 INFO  
(TEST-AutoCommitTest.testCommitWithin-seed#[8E92EFD6C8B062D]) [    
x:collection1] o.a.s.c.SolrConfig current version of reque

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

predicate_shard2_replica1] o.a.s.c.CachingDirectoryFactory looking to close 
/export/home/jenkins/workspace/Lucene-Solr-master-Solaris/solr/build/solr-solrj/test/J1/temp/solr.common.cloud.TestCollectionStateWatchers_E4E71EE81F326B09-001/tempDir-001/node3/./falsepredicate_shard2_replica1/data/index
 
[CachedDir<<refCount=0;path=/export/home/jenkins/workspace/Lucene-Solr-master-Solaris/solr/build/solr-solrj/test/J1/temp/solr.common.cloud.TestCollectionStateWatchers_E4E71EE81F326B09-001/tempDir-001/node3/./falsepredicate_shard2_replica1/data/index;done=false>>]
   [junit4]   2> 216408 INFO  (coreCloseExecutor-529-thread-3) 
[n:127.0.0.1:65247_solr c:falsepredicate s:shard2 r:core_node2 
x:falsepredicate_shard2_replica1] o.a.s.c.CachingDirectoryFactory Closing 
directory, CoreContainer#isShutdown=true
   [junit4]   2> 216408 INFO  (coreCloseExecutor-529-thread-3) 
[n:127.0.0.1:65247_solr c:falsepredicate s:shard2 r:core_node2 
x:falsepredicate_shard2_replica1] o.a.s.c.CachingDirectoryFactory Closing 
directory: 
/export/home/jenkins/workspace/Lucene-Solr-master-Solaris/solr/build/solr-solrj/test/J1/temp/solr.common.cloud.TestCollectionStateWatchers_E4E71EE81F326B09-001/tempDir-001/node3/./falsepredicate_shard2_replica1/data/index
   [junit4]   2> 216401 INFO  
(zkCallback-1006-thread-6-processing-n:127.0.0.1:59726_solr) 
[n:127.0.0.1:59726_solr    ] o.a.s.c.c.ZkStateReader A live node change: 
[WatchedEvent state:SyncConnected type:NodeChildrenChanged path:/live_nodes], 
has occurred - updating... (live nodes size: [3])
   [junit4]   2> 216408 INFO  (coreCloseExecutor-529-thread-3) 
[n:127.0.0.1:65247_solr c:falsepredicate s:shard2 r:core_node2 
x:falsepredicate_shard2_replica1] o.a.s.c.CachingDirectoryFactory looking to 
close 
/export/home/jenkins/workspace/Lucene-Solr-master-Solaris/solr/build/solr-solrj/test/J1/temp/solr.common.cloud.TestCollectionStateWatchers_E4E71EE81F326B09-001/tempDir-001/node3/./falsepredicate_shard2_replica1/data/snapshot_metadata
 
[CachedDir<<refCount=0;path=/export/home/jenkins/workspace/Lucene-Solr-master-Solaris/solr/build/solr-solrj/test/J1/temp/solr.common.cloud.TestCollectionStateWatchers_E4E71EE81F326B09-001/tempDir-001/node3/./falsepredicate_shard2_replica1/data/snapshot_metadata;done=false>>]
   [junit4]   2> 216408 INFO  (coreCloseExecutor-529-thread-3) 
[n:127.0.0.1:65247_solr c:falsepredicate s:shard2 r:core_node2 
x:falsepredicate_shard2_replica1] o.a.s.c.CachingDirectoryFactory Closing 
directory, CoreContainer#isShutdown=true
   [junit4]   2> 216408 INFO  (coreCloseExecutor-529-thread-3) 
[n:127.0.0.1:65247_solr c:falsepredicate s:shard2 r:core_node2 
x:falsepredicate_shard2_replica1] o.a.s.c.CachingDirectoryFactory Closing 
directory: 
/export/home/jenkins/workspace/Lucene-Solr-master-Solaris/solr/build/solr-solrj/test/J1/temp/solr.common.cloud.TestCollectionStateWatchers_E4E71EE81F326B09-001/tempDir-001/node3/./falsepredicate_shard2_replica1/data/snapshot_metadata
   [junit4]   2> 216414 INFO  (jetty-launcher-983-thread-2) [    ] 
o.a.s.c.Overseer Overseer 
(id=96427202213969929-127.0.0.1:65247_solr-n_0000000001) closing
   [junit4]   2> 216414 INFO  
(zkCallback-1006-thread-5-processing-n:127.0.0.1:59726_solr) 
[n:127.0.0.1:59726_solr    ] o.a.s.c.c.ZkStateReader Updating data for 
[testcollection] from [12] to [13]
   [junit4]   2> 216414 INFO  
(OverseerStateUpdate-96427202213969929-127.0.0.1:65247_solr-n_0000000001) 
[n:127.0.0.1:65247_solr    ] o.a.s.c.Overseer Overseer Loop exiting : 
127.0.0.1:65247_solr
   [junit4]   2> 216415 INFO  
(zkCallback-999-thread-7-processing-n:127.0.0.1:65247_solr) 
[n:127.0.0.1:65247_solr    ] o.a.s.c.c.ZkStateReader A live node change: 
[WatchedEvent state:SyncConnected type:NodeChildrenChanged path:/live_nodes], 
has occurred - updating... (live nodes size: [3])
   [junit4]   2> 216415 INFO  
(zkCallback-999-thread-4-processing-n:127.0.0.1:65247_solr) 
[n:127.0.0.1:65247_solr    ] o.a.s.c.c.ZkStateReader Updated live nodes from 
ZooKeeper... (3) -> (2)
   [junit4]   2> 216416 WARN  (NIOServerCxn.Factory:0.0.0.0/0.0.0.0:0) [    ] 
o.a.z.s.NIOServerCnxn caught end of stream exception
   [junit4]   2> EndOfStreamException: Unable to read additional data from 
client sessionid 0x15694078ea6000c, likely client has closed socket
   [junit4]   2>        at 
org.apache.zookeeper.server.NIOServerCnxn.doIO(NIOServerCnxn.java:228)
   [junit4]   2>        at 
org.apache.zookeeper.server.NIOServerCnxnFactory.run(NIOServerCnxnFactory.java:208)
   [junit4]   2>        at java.lang.Thread.run(Thread.java:745)
   [junit4]   2> 216417 INFO  
(zkCallback-999-thread-6-processing-n:127.0.0.1:65247_solr) 
[n:127.0.0.1:65247_solr    ] o.a.s.c.c.ZkStateReader Updating data for 
[testcollection] from [12] to [13]
   [junit4]   2> 216418 INFO  
(zkCallback-999-thread-7-processing-n:127.0.0.1:65247_solr) 
[n:127.0.0.1:65247_solr    ] o.a.s.c.c.ZkStateReader Updated live nodes from 
ZooKeeper... (2) -> (1)
   [junit4]   2> 216420 INFO  
(zkCallback-999-thread-7-processing-n:127.0.0.1:65247_solr) 
[n:127.0.0.1:65247_solr    ] o.a.s.c.c.ZkStateReader A live node change: 
[WatchedEvent state:SyncConnected type:NodeChildrenChanged path:/live_nodes], 
has occurred - updating... (live nodes size: [1])
   [junit4]   2> 216420 WARN  
(zkCallback-999-thread-7-processing-n:127.0.0.1:65247_solr) 
[n:127.0.0.1:65247_solr    ] o.a.s.c.c.ZkStateReader ZooKeeper watch triggered, 
but Solr cannot talk to ZK: [KeeperErrorCode = Session expired for /live_nodes]
   [junit4]   2> 216421 WARN  (NIOServerCxn.Factory:0.0.0.0/0.0.0.0:0) [    ] 
o.a.z.s.NIOServerCnxn caught end of stream exception
   [junit4]   2> EndOfStreamException: Unable to read additional data from 
client sessionid 0x15694078ea60009, likely client has closed socket
   [junit4]   2>        at 
org.apache.zookeeper.server.NIOServerCnxn.doIO(NIOServerCnxn.java:228)
   [junit4]   2>        at 
org.apache.zookeeper.server.NIOServerCnxnFactory.run(NIOServerCnxnFactory.java:208)
   [junit4]   2>        at java.lang.Thread.run(Thread.java:745)
   [junit4]   2> 216422 INFO  (jetty-launcher-983-thread-2) [    ] 
o.e.j.s.h.ContextHandler Stopped 
o.e.j.s.ServletContextHandler@761dbcfe{/solr,null,UNAVAILABLE}
   [junit4]   2> 217913 WARN  
(zkCallback-1006-thread-6-processing-n:127.0.0.1:59726_solr) 
[n:127.0.0.1:59726_solr    ] o.a.s.c.c.ZkStateReader ZooKeeper watch triggered, 
but Solr cannot talk to ZK: [KeeperErrorCode = Session expired for /live_nodes]
   [junit4]   2> 217913 INFO  (jetty-launcher-983-thread-1) [    ] 
o.e.j.s.h.ContextHandler Stopped 
o.e.j.s.ServletContextHandler@2b972f81{/solr,null,UNAVAILABLE}
   [junit4]   2> 217916 INFO  
(SUITE-TestCollectionStateWatchers-seed#[E4E71EE81F326B09]-worker) [    ] 
o.a.s.c.ZkTestServer connecting to 127.0.0.1:60084 60084
   [junit4]   2> 218015 INFO  (Thread-277) [    ] o.a.s.c.ZkTestServer 
connecting to 127.0.0.1:60084 60084
   [junit4]   2> 218018 WARN  (Thread-277) [    ] o.a.s.c.ZkTestServer Watch 
limit violations: 
   [junit4]   2> Maximum concurrent create/delete watches above limit:
   [junit4]   2> 
   [junit4]   2>        8       /solr/aliases.json
   [junit4]   2>        7       /solr/security.json
   [junit4]   2>        7       /solr/configs/config
   [junit4]   2>        3       /solr/collections/stateformat1/state.json
   [junit4]   2> 
   [junit4]   2> Maximum concurrent data watches above limit:
   [junit4]   2> 
   [junit4]   2>        17      /solr/collections/falsepredicate/state.json
   [junit4]   2>        12      /solr/collections/waitforstate/state.json
   [junit4]   2>        8       /solr/clusterprops.json
   [junit4]   2>        8       /solr/clusterstate.json
   [junit4]   2>        6       /solr/collections/testcollection/state.json
   [junit4]   2>        3       /solr/collections/stateformat1/state.json
   [junit4]   2>        2       /solr/collections/currentstate/state.json
   [junit4]   2>        2       
/solr/overseer_elect/election/96427202213969929-127.0.0.1:65247_solr-n_0000000001
   [junit4]   2>        2       
/solr/overseer_elect/election/96427202213969932-127.0.0.1:59726_solr-n_0000000003
   [junit4]   2>        2       /solr/collections/delayed/state.json
   [junit4]   2> 
   [junit4]   2> Maximum concurrent children watches above limit:
   [junit4]   2> 
   [junit4]   2>        79      /solr/overseer/queue
   [junit4]   2>        36      /solr/overseer/collection-queue-work
   [junit4]   2>        16      /solr/overseer/queue-work
   [junit4]   2>        8       /solr/collections
   [junit4]   2>        5       /solr/live_nodes
   [junit4]   2> 
   [junit4]   2> 218018 INFO  
(SUITE-TestCollectionStateWatchers-seed#[E4E71EE81F326B09]-worker) [    ] 
o.a.s.SolrTestCaseJ4 ###deleteCore
   [junit4]   2> NOTE: leaving temporary files on disk at: 
/export/home/jenkins/workspace/Lucene-Solr-master-Solaris/solr/build/solr-solrj/test/J1/temp/solr.common.cloud.TestCollectionStateWatchers_E4E71EE81F326B09-001
   [junit4]   2> NOTE: test params are: 
codec=HighCompressionCompressingStoredFields(storedFieldsFormat=CompressingStoredFieldsFormat(compressionMode=HIGH_COMPRESSION,
 chunkSize=24328, maxDocsPerChunk=329, blockSize=4), 
termVectorsFormat=CompressingTermVectorsFormat(compressionMode=HIGH_COMPRESSION,
 chunkSize=24328, blockSize=4)), sim=ClassicSimilarity, locale=es-PE, 
timezone=AST
   [junit4]   2> NOTE: SunOS 5.11 amd64/Oracle Corporation 1.8.0_102 
(64-bit)/cpus=3,threads=1,free=101056952,total=326107136
   [junit4]   2> NOTE: All tests run in this JVM: 
[SolrExampleStreamingBinaryTest, SolrExampleBinaryTest, SolrQueryTest, 
SolrPingTest, CloudSolrClientMultiConstructorTest, 
TestCloudSolrClientConnections, TestClusteringResponse, FacetFieldTest, 
SolrExampleJettyTest, LargeVolumeJettyTest, SolrZkClientTest, 
AnlysisResponseBaseTest, ConcurrentUpdateSolrClientBuilderTest, 
TestNamedListCodec, TestZkConfigManager, QueryResponseTest, 
StreamExpressionTest, TestSuggesterResponse, MergeIndexesEmbeddedTest, 
TestSolrJErrorHandling, BasicHttpSolrClientTest, HttpSolrClientBuilderTest, 
LBHttpSolrClientBuilderTest, GraphExpressionTest, GraphTest, JdbcTest, 
JDBCStreamTest, TestConfigSetAdminRequest, TestDelegationTokenResponse, 
TestCollectionStateWatchers]
   [junit4] Completed [85/85 (1!)] on J1 in 55.61s, 9 tests, 1 error <<< 
FAILURES!

[...truncated 59439 lines...]

---------------------------------------------------------------------
To unsubscribe, e-mail: [email protected]
For additional commands, e-mail: [email protected]

Reply via email to