You are viewing a plain text version of this content. The canonical link for it is here.
Posted to dev@lucene.apache.org by Policeman Jenkins Server <je...@thetaphi.de> on 2014/01/18 20:52:10 UTC
[JENKINS] Lucene-Solr-trunk-Linux (32bit/jdk1.7.0_51) - Build #
9144 - Failure!
Build: http://jenkins.thetaphi.de/job/Lucene-Solr-trunk-Linux/9144/
Java: 32bit/jdk1.7.0_51 -server -XX:+UseParallelGC
1 tests failed.
REGRESSION: org.apache.solr.cloud.OverseerRolesTest.testDistribSearch
Error Message:
could not set the new overseer
Stack Trace:
java.lang.AssertionError: could not set the new overseer
at __randomizedtesting.SeedInfo.seed([55259C2FD4604DB9:D4C31237A33F2D85]:0)
at org.junit.Assert.fail(Assert.java:93)
at org.junit.Assert.assertTrue(Assert.java:43)
at org.apache.solr.cloud.OverseerRolesTest.addOverseerRole2ExistingNodes(OverseerRolesTest.java:120)
at org.apache.solr.cloud.OverseerRolesTest.doTest(OverseerRolesTest.java:86)
at org.apache.solr.BaseDistributedSearchTestCase.testDistribSearch(BaseDistributedSearchTestCase.java:867)
at sun.reflect.NativeMethodAccessorImpl.invoke0(Native Method)
at sun.reflect.NativeMethodAccessorImpl.invoke(NativeMethodAccessorImpl.java:57)
at sun.reflect.DelegatingMethodAccessorImpl.invoke(DelegatingMethodAccessorImpl.java:43)
at java.lang.reflect.Method.invoke(Method.java:606)
at com.carrotsearch.randomizedtesting.RandomizedRunner.invoke(RandomizedRunner.java:1559)
at com.carrotsearch.randomizedtesting.RandomizedRunner.access$600(RandomizedRunner.java:79)
at com.carrotsearch.randomizedtesting.RandomizedRunner$6.evaluate(RandomizedRunner.java:737)
at com.carrotsearch.randomizedtesting.RandomizedRunner$7.evaluate(RandomizedRunner.java:773)
at com.carrotsearch.randomizedtesting.RandomizedRunner$8.evaluate(RandomizedRunner.java:787)
at com.carrotsearch.randomizedtesting.rules.SystemPropertiesRestoreRule$1.evaluate(SystemPropertiesRestoreRule.java:53)
at org.apache.lucene.util.TestRuleSetupTeardownChained$1.evaluate(TestRuleSetupTeardownChained.java:50)
at org.apache.lucene.util.TestRuleFieldCacheSanity$1.evaluate(TestRuleFieldCacheSanity.java:51)
at org.apache.lucene.util.AbstractBeforeAfterRule$1.evaluate(AbstractBeforeAfterRule.java:46)
at com.carrotsearch.randomizedtesting.rules.SystemPropertiesInvariantRule$1.evaluate(SystemPropertiesInvariantRule.java:55)
at org.apache.lucene.util.TestRuleThreadAndTestName$1.evaluate(TestRuleThreadAndTestName.java:49)
at org.apache.lucene.util.TestRuleIgnoreAfterMaxFailures$1.evaluate(TestRuleIgnoreAfterMaxFailures.java:70)
at org.apache.lucene.util.TestRuleMarkFailure$1.evaluate(TestRuleMarkFailure.java:48)
at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
at com.carrotsearch.randomizedtesting.ThreadLeakControl$StatementRunner.run(ThreadLeakControl.java:358)
at com.carrotsearch.randomizedtesting.ThreadLeakControl.forkTimeoutingTask(ThreadLeakControl.java:782)
at com.carrotsearch.randomizedtesting.ThreadLeakControl$3.evaluate(ThreadLeakControl.java:442)
at com.carrotsearch.randomizedtesting.RandomizedRunner.runSingleTest(RandomizedRunner.java:746)
at com.carrotsearch.randomizedtesting.RandomizedRunner$3.evaluate(RandomizedRunner.java:648)
at com.carrotsearch.randomizedtesting.RandomizedRunner$4.evaluate(RandomizedRunner.java:682)
at com.carrotsearch.randomizedtesting.RandomizedRunner$5.evaluate(RandomizedRunner.java:693)
at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
at com.carrotsearch.randomizedtesting.rules.SystemPropertiesRestoreRule$1.evaluate(SystemPropertiesRestoreRule.java:53)
at org.apache.lucene.util.AbstractBeforeAfterRule$1.evaluate(AbstractBeforeAfterRule.java:46)
at org.apache.lucene.util.TestRuleStoreClassName$1.evaluate(TestRuleStoreClassName.java:42)
at com.carrotsearch.randomizedtesting.rules.SystemPropertiesInvariantRule$1.evaluate(SystemPropertiesInvariantRule.java:55)
at com.carrotsearch.randomizedtesting.rules.NoShadowingOrOverridesOnMethodsRule$1.evaluate(NoShadowingOrOverridesOnMethodsRule.java:39)
at com.carrotsearch.randomizedtesting.rules.NoShadowingOrOverridesOnMethodsRule$1.evaluate(NoShadowingOrOverridesOnMethodsRule.java:39)
at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
at org.apache.lucene.util.TestRuleAssertionsRequired$1.evaluate(TestRuleAssertionsRequired.java:43)
at org.apache.lucene.util.TestRuleMarkFailure$1.evaluate(TestRuleMarkFailure.java:48)
at org.apache.lucene.util.TestRuleIgnoreAfterMaxFailures$1.evaluate(TestRuleIgnoreAfterMaxFailures.java:70)
at org.apache.lucene.util.TestRuleIgnoreTestSuites$1.evaluate(TestRuleIgnoreTestSuites.java:55)
at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
at com.carrotsearch.randomizedtesting.ThreadLeakControl$StatementRunner.run(ThreadLeakControl.java:358)
at java.lang.Thread.run(Thread.java:744)
Build Log:
[...truncated 10422 lines...]
[junit4] Suite: org.apache.solr.cloud.OverseerRolesTest
[junit4] 2> 594027 T2153 oas.BaseDistributedSearchTestCase.initHostContext Setting hostContext system property: /
[junit4] 2> 594030 T2153 oas.SolrTestCaseJ4.setUp ###Starting testDistribSearch
[junit4] 2> Creating dataDir: /mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build/solr-core/test/J0/./solrtest-OverseerRolesTest-1390074066538
[junit4] 2> 594031 T2153 oasc.ZkTestServer.run STARTING ZK TEST SERVER
[junit4] 2> 594031 T2154 oasc.ZkTestServer$ZKServerMain.runFromConfig Starting server
[junit4] 2> 594132 T2153 oasc.ZkTestServer.run start zk server on port:59863
[junit4] 2> 594133 T2153 oascc.ConnectionManager.waitForConnected Waiting for client to connect to ZooKeeper
[junit4] 2> 594144 T2160 oascc.ConnectionManager.process Watcher org.apache.solr.common.cloud.ConnectionManager@144ad52 name:ZooKeeperConnection Watcher:127.0.0.1:59863 got event WatchedEvent state:SyncConnected type:None path:null path:null type:None
[junit4] 2> 594145 T2153 oascc.ConnectionManager.waitForConnected Client is connected to ZooKeeper
[junit4] 2> 594145 T2153 oascc.SolrZkClient.makePath makePath: /solr
[junit4] 2> 594149 T2153 oascc.ConnectionManager.waitForConnected Waiting for client to connect to ZooKeeper
[junit4] 2> 594150 T2162 oascc.ConnectionManager.process Watcher org.apache.solr.common.cloud.ConnectionManager@58833d name:ZooKeeperConnection Watcher:127.0.0.1:59863/solr got event WatchedEvent state:SyncConnected type:None path:null path:null type:None
[junit4] 2> 594150 T2153 oascc.ConnectionManager.waitForConnected Client is connected to ZooKeeper
[junit4] 2> 594151 T2153 oascc.SolrZkClient.makePath makePath: /collections/collection1
[junit4] 2> 594153 T2153 oascc.SolrZkClient.makePath makePath: /collections/collection1/shards
[junit4] 2> 594155 T2153 oascc.SolrZkClient.makePath makePath: /collections/control_collection
[junit4] 2> 594156 T2153 oascc.SolrZkClient.makePath makePath: /collections/control_collection/shards
[junit4] 2> 594158 T2153 oasc.AbstractZkTestCase.putConfig put /mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build/solr-core/test-files/solr/collection1/conf/solrconfig-tlog.xml to /configs/conf1/solrconfig.xml
[junit4] 2> 594158 T2153 oascc.SolrZkClient.makePath makePath: /configs/conf1/solrconfig.xml
[junit4] 2> 594161 T2153 oasc.AbstractZkTestCase.putConfig put /mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build/solr-core/test-files/solr/collection1/conf/schema.xml to /configs/conf1/schema.xml
[junit4] 2> 594161 T2153 oascc.SolrZkClient.makePath makePath: /configs/conf1/schema.xml
[junit4] 2> 594163 T2153 oasc.AbstractZkTestCase.putConfig put /mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build/solr-core/test-files/solr/collection1/conf/solrconfig.snippet.randomindexconfig.xml to /configs/conf1/solrconfig.snippet.randomindexconfig.xml
[junit4] 2> 594164 T2153 oascc.SolrZkClient.makePath makePath: /configs/conf1/solrconfig.snippet.randomindexconfig.xml
[junit4] 2> 594165 T2153 oasc.AbstractZkTestCase.putConfig put /mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build/solr-core/test-files/solr/collection1/conf/stopwords.txt to /configs/conf1/stopwords.txt
[junit4] 2> 594165 T2153 oascc.SolrZkClient.makePath makePath: /configs/conf1/stopwords.txt
[junit4] 2> 594167 T2153 oasc.AbstractZkTestCase.putConfig put /mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build/solr-core/test-files/solr/collection1/conf/protwords.txt to /configs/conf1/protwords.txt
[junit4] 2> 594168 T2153 oascc.SolrZkClient.makePath makePath: /configs/conf1/protwords.txt
[junit4] 2> 594169 T2153 oasc.AbstractZkTestCase.putConfig put /mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build/solr-core/test-files/solr/collection1/conf/currency.xml to /configs/conf1/currency.xml
[junit4] 2> 594170 T2153 oascc.SolrZkClient.makePath makePath: /configs/conf1/currency.xml
[junit4] 2> 594171 T2153 oasc.AbstractZkTestCase.putConfig put /mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build/solr-core/test-files/solr/collection1/conf/enumsConfig.xml to /configs/conf1/enumsConfig.xml
[junit4] 2> 594172 T2153 oascc.SolrZkClient.makePath makePath: /configs/conf1/enumsConfig.xml
[junit4] 2> 594174 T2153 oasc.AbstractZkTestCase.putConfig put /mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build/solr-core/test-files/solr/collection1/conf/open-exchange-rates.json to /configs/conf1/open-exchange-rates.json
[junit4] 2> 594174 T2153 oascc.SolrZkClient.makePath makePath: /configs/conf1/open-exchange-rates.json
[junit4] 2> 594176 T2153 oasc.AbstractZkTestCase.putConfig put /mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build/solr-core/test-files/solr/collection1/conf/mapping-ISOLatin1Accent.txt to /configs/conf1/mapping-ISOLatin1Accent.txt
[junit4] 2> 594176 T2153 oascc.SolrZkClient.makePath makePath: /configs/conf1/mapping-ISOLatin1Accent.txt
[junit4] 2> 594178 T2153 oasc.AbstractZkTestCase.putConfig put /mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build/solr-core/test-files/solr/collection1/conf/old_synonyms.txt to /configs/conf1/old_synonyms.txt
[junit4] 2> 594178 T2153 oascc.SolrZkClient.makePath makePath: /configs/conf1/old_synonyms.txt
[junit4] 2> 594180 T2153 oasc.AbstractZkTestCase.putConfig put /mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build/solr-core/test-files/solr/collection1/conf/synonyms.txt to /configs/conf1/synonyms.txt
[junit4] 2> 594180 T2153 oascc.SolrZkClient.makePath makePath: /configs/conf1/synonyms.txt
[junit4] 2> 594247 T2153 oejs.Server.doStart jetty-8.1.10.v20130312
[junit4] 2> 594251 T2153 oejs.AbstractConnector.doStart Started SelectChannelConnector@127.0.0.1:60106
[junit4] 2> 594251 T2153 oass.SolrDispatchFilter.init SolrDispatchFilter.init()
[junit4] 2> 594252 T2153 oasc.SolrResourceLoader.locateSolrHome JNDI not configured for solr (NoInitialContextEx)
[junit4] 2> 594252 T2153 oasc.SolrResourceLoader.locateSolrHome using system property solr.solr.home: ../../../../../../../../../../mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build/solr-core/test/J0/./org.apache.solr.cloud.OverseerRolesTest-controljetty-1390074066689
[junit4] 2> 594252 T2153 oasc.SolrResourceLoader.<init> new SolrResourceLoader for directory: '../../../../../../../../../../mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build/solr-core/test/J0/./org.apache.solr.cloud.OverseerRolesTest-controljetty-1390074066689/'
[junit4] 2> 594262 T2153 oasc.ConfigSolr.fromFile Loading container configuration from /mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build/solr-core/test/J0/../../../../../../../../../../mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build/solr-core/test/J0/./org.apache.solr.cloud.OverseerRolesTest-controljetty-1390074066689/solr.xml
[junit4] 2> 594295 T2153 oasc.ConfigSolrXml.<init> Config-defined core root directory:
[junit4] 2> 594295 T2153 oasc.CoreContainer.<init> New CoreContainer 18795548
[junit4] 2> 594296 T2153 oasc.CoreContainer.load Loading cores into CoreContainer [instanceDir=../../../../../../../../../../mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build/solr-core/test/J0/./org.apache.solr.cloud.OverseerRolesTest-controljetty-1390074066689/]
[junit4] 2> 594297 T2153 oashc.HttpShardHandlerFactory.getParameter Setting socketTimeout to: 90000
[junit4] 2> 594297 T2153 oashc.HttpShardHandlerFactory.getParameter Setting urlScheme to: http://
[junit4] 2> 594297 T2153 oashc.HttpShardHandlerFactory.getParameter Setting connTimeout to: 15000
[junit4] 2> 594298 T2153 oashc.HttpShardHandlerFactory.getParameter Setting maxConnectionsPerHost to: 20
[junit4] 2> 594298 T2153 oashc.HttpShardHandlerFactory.getParameter Setting corePoolSize to: 0
[junit4] 2> 594298 T2153 oashc.HttpShardHandlerFactory.getParameter Setting maximumPoolSize to: 2147483647
[junit4] 2> 594299 T2153 oashc.HttpShardHandlerFactory.getParameter Setting maxThreadIdleTime to: 5
[junit4] 2> 594299 T2153 oashc.HttpShardHandlerFactory.getParameter Setting sizeOfQueue to: -1
[junit4] 2> 594299 T2153 oashc.HttpShardHandlerFactory.getParameter Setting fairnessPolicy to: false
[junit4] 2> 594303 T2153 oasl.LogWatcher.createWatcher SLF4J impl is org.slf4j.impl.Log4jLoggerFactory
[junit4] 2> 594303 T2153 oasl.LogWatcher.newRegisteredLogWatcher Registering Log Listener [Log4j (org.slf4j.impl.Log4jLoggerFactory)]
[junit4] 2> 594303 T2153 oasc.CoreContainer.load Host Name: 127.0.0.1
[junit4] 2> 594304 T2153 oasc.ZkContainer.initZooKeeper Zookeeper client=127.0.0.1:59863/solr
[junit4] 2> 594304 T2153 oasc.ZkController.checkChrootPath zkHost includes chroot
[junit4] 2> 594305 T2153 oascc.ConnectionManager.waitForConnected Waiting for client to connect to ZooKeeper
[junit4] 2> 594306 T2173 oascc.ConnectionManager.process Watcher org.apache.solr.common.cloud.ConnectionManager@ea8063 name:ZooKeeperConnection Watcher:127.0.0.1:59863 got event WatchedEvent state:SyncConnected type:None path:null path:null type:None
[junit4] 2> 594306 T2153 oascc.ConnectionManager.waitForConnected Client is connected to ZooKeeper
[junit4] 2> 594308 T2153 oascc.ConnectionManager.waitForConnected Waiting for client to connect to ZooKeeper
[junit4] 2> 594309 T2175 oascc.ConnectionManager.process Watcher org.apache.solr.common.cloud.ConnectionManager@1635da7 name:ZooKeeperConnection Watcher:127.0.0.1:59863/solr got event WatchedEvent state:SyncConnected type:None path:null path:null type:None
[junit4] 2> 594309 T2153 oascc.ConnectionManager.waitForConnected Client is connected to ZooKeeper
[junit4] 2> 594310 T2153 oascc.SolrZkClient.makePath makePath: /overseer/queue
[junit4] 2> 594312 T2153 oascc.SolrZkClient.makePath makePath: /overseer/collection-queue-work
[junit4] 2> 594314 T2153 oascc.SolrZkClient.makePath makePath: /live_nodes
[junit4] 2> 594315 T2153 oasc.ZkController.createEphemeralLiveNode Register node as live in ZooKeeper:/live_nodes/127.0.0.1:60106_
[junit4] 2> 594316 T2153 oascc.SolrZkClient.makePath makePath: /live_nodes/127.0.0.1:60106_
[junit4] 2> 594318 T2153 oascc.SolrZkClient.makePath makePath: /overseer_elect
[junit4] 2> 594319 T2153 oascc.SolrZkClient.makePath makePath: /overseer_elect/election
[junit4] 2> 594322 T2153 oascc.SolrZkClient.makePath makePath: /overseer_elect/leader
[junit4] 2> 594324 T2153 oasc.Overseer.start Overseer (id=91099894024765443-127.0.0.1:60106_-n_0000000000) starting
[junit4] 2> 594331 T2153 oascc.SolrZkClient.makePath makePath: /overseer/queue-work
[junit4] 2> 594333 T2177 oasc.OverseerCollectionProcessor.run Process current queue of collection creations
[junit4] 2> 594334 T2153 oascc.SolrZkClient.makePath makePath: /clusterstate.json
[junit4] 2> 594334 T2177 oasc.OverseerCollectionProcessor.prioritizeOverseerNodes prioritizing overseer nodes
[junit4] 2> 594335 T2153 oascc.SolrZkClient.makePath makePath: /aliases.json
[junit4] 2> 594337 T2153 oascc.ZkStateReader.createClusterStateWatchersAndUpdate Updating cluster state from ZooKeeper...
[junit4] 2> 594338 T2176 oasc.Overseer$ClusterStateUpdater.run Starting to work on the main queue
[junit4] 2> 594340 T2153 oasc.CorePropertiesLocator.discover Looking for core definitions underneath /mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build/solr-core/test/J0/../../../../../../../../../../mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build/solr-core/test/J0/./org.apache.solr.cloud.OverseerRolesTest-controljetty-1390074066689
[junit4] 2> 594341 T2153 oasc.CorePropertiesLocator.discoverUnder Found core conf in /mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build/solr-core/test/J0/../../../../../../../../../../mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build/solr-core/test/J0/./org.apache.solr.cloud.OverseerRolesTest-controljetty-1390074066689/conf/
[junit4] 2> 594371 T2153 oasc.CorePropertiesLocator.discover Found 1 core definitions
[junit4] 2> 594371 T2153 oass.SolrDispatchFilter.init user.dir=/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build/solr-core/test/J0
[junit4] 2> 594372 T2153 oass.SolrDispatchFilter.init SolrDispatchFilter.init() done
[junit4] 2> 594373 T2153 oascc.ConnectionManager.waitForConnected Waiting for client to connect to ZooKeeper
[junit4] 2> 594374 T2180 oascc.ConnectionManager.process Watcher org.apache.solr.common.cloud.ConnectionManager@1948e7d name:ZooKeeperConnection Watcher:127.0.0.1:59863/solr got event WatchedEvent state:SyncConnected type:None path:null path:null type:None
[junit4] 2> 594374 T2153 oascc.ConnectionManager.waitForConnected Client is connected to ZooKeeper
[junit4] 2> 594375 T2153 oascc.ZkStateReader.createClusterStateWatchersAndUpdate Updating cluster state from ZooKeeper...
[junit4] 2> 594376 T2153 oasc.ChaosMonkey.monkeyLog monkey: init - expire sessions:false cause connection loss:false
[junit4] 2> 594438 T2153 oejs.Server.doStart jetty-8.1.10.v20130312
[junit4] 2> 594440 T2153 oejs.AbstractConnector.doStart Started SelectChannelConnector@127.0.0.1:56902
[junit4] 2> 594441 T2153 oass.SolrDispatchFilter.init SolrDispatchFilter.init()
[junit4] 2> 594441 T2153 oasc.SolrResourceLoader.locateSolrHome JNDI not configured for solr (NoInitialContextEx)
[junit4] 2> 594441 T2153 oasc.SolrResourceLoader.locateSolrHome using system property solr.solr.home: ./org.apache.solr.cloud.OverseerRolesTest-jetty1-1390074066884
[junit4] 2> 594442 T2153 oasc.SolrResourceLoader.<init> new SolrResourceLoader for directory: './org.apache.solr.cloud.OverseerRolesTest-jetty1-1390074066884/'
[junit4] 2> 594452 T2153 oasc.ConfigSolr.fromFile Loading container configuration from /mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build/solr-core/test/J0/./org.apache.solr.cloud.OverseerRolesTest-jetty1-1390074066884/solr.xml
[junit4] 2> 594484 T2153 oasc.ConfigSolrXml.<init> Config-defined core root directory:
[junit4] 2> 594484 T2153 oasc.CoreContainer.<init> New CoreContainer 789986
[junit4] 2> 594484 T2153 oasc.CoreContainer.load Loading cores into CoreContainer [instanceDir=./org.apache.solr.cloud.OverseerRolesTest-jetty1-1390074066884/]
[junit4] 2> 594485 T2153 oashc.HttpShardHandlerFactory.getParameter Setting socketTimeout to: 90000
[junit4] 2> 594485 T2153 oashc.HttpShardHandlerFactory.getParameter Setting urlScheme to: http://
[junit4] 2> 594486 T2153 oashc.HttpShardHandlerFactory.getParameter Setting connTimeout to: 15000
[junit4] 2> 594486 T2153 oashc.HttpShardHandlerFactory.getParameter Setting maxConnectionsPerHost to: 20
[junit4] 2> 594486 T2153 oashc.HttpShardHandlerFactory.getParameter Setting corePoolSize to: 0
[junit4] 2> 594487 T2153 oashc.HttpShardHandlerFactory.getParameter Setting maximumPoolSize to: 2147483647
[junit4] 2> 594487 T2153 oashc.HttpShardHandlerFactory.getParameter Setting maxThreadIdleTime to: 5
[junit4] 2> 594487 T2153 oashc.HttpShardHandlerFactory.getParameter Setting sizeOfQueue to: -1
[junit4] 2> 594487 T2153 oashc.HttpShardHandlerFactory.getParameter Setting fairnessPolicy to: false
[junit4] 2> 594490 T2153 oasl.LogWatcher.createWatcher SLF4J impl is org.slf4j.impl.Log4jLoggerFactory
[junit4] 2> 594490 T2153 oasl.LogWatcher.newRegisteredLogWatcher Registering Log Listener [Log4j (org.slf4j.impl.Log4jLoggerFactory)]
[junit4] 2> 594490 T2153 oasc.CoreContainer.load Host Name: 127.0.0.1
[junit4] 2> 594491 T2153 oasc.ZkContainer.initZooKeeper Zookeeper client=127.0.0.1:59863/solr
[junit4] 2> 594491 T2153 oasc.ZkController.checkChrootPath zkHost includes chroot
[junit4] 2> 594491 T2153 oascc.ConnectionManager.waitForConnected Waiting for client to connect to ZooKeeper
[junit4] 2> 594493 T2191 oascc.ConnectionManager.process Watcher org.apache.solr.common.cloud.ConnectionManager@1637595 name:ZooKeeperConnection Watcher:127.0.0.1:59863 got event WatchedEvent state:SyncConnected type:None path:null path:null type:None
[junit4] 2> 594493 T2153 oascc.ConnectionManager.waitForConnected Client is connected to ZooKeeper
[junit4] 2> 594495 T2153 oascc.ConnectionManager.waitForConnected Waiting for client to connect to ZooKeeper
[junit4] 2> 594496 T2193 oascc.ConnectionManager.process Watcher org.apache.solr.common.cloud.ConnectionManager@d5011 name:ZooKeeperConnection Watcher:127.0.0.1:59863/solr got event WatchedEvent state:SyncConnected type:None path:null path:null type:None
[junit4] 2> 594496 T2153 oascc.ConnectionManager.waitForConnected Client is connected to ZooKeeper
[junit4] 2> 594499 T2153 oascc.ZkStateReader.createClusterStateWatchersAndUpdate Updating cluster state from ZooKeeper...
[junit4] 2> 595501 T2153 oasc.ZkController.createEphemeralLiveNode Register node as live in ZooKeeper:/live_nodes/127.0.0.1:56902_
[junit4] 2> 595503 T2153 oascc.SolrZkClient.makePath makePath: /live_nodes/127.0.0.1:56902_
[junit4] 2> 595505 T2180 oascc.ZkStateReader$3.process Updating live nodes... (2)
[junit4] 2> 595505 T2175 oascc.ZkStateReader$3.process Updating live nodes... (2)
[junit4] 2> 595505 T2193 oascc.ZkStateReader$3.process Updating live nodes... (2)
[junit4] 2> 595509 T2153 oasc.CorePropertiesLocator.discover Looking for core definitions underneath /mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build/solr-core/test/J0/./org.apache.solr.cloud.OverseerRolesTest-jetty1-1390074066884
[junit4] 2> 595510 T2153 oasc.CorePropertiesLocator.discoverUnder Found core conf in /mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build/solr-core/test/J0/./org.apache.solr.cloud.OverseerRolesTest-jetty1-1390074066884/conf/
[junit4] 2> 595531 T2153 oasc.CorePropertiesLocator.discover Found 1 core definitions
[junit4] 2> 595532 T2153 oass.SolrDispatchFilter.init user.dir=/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build/solr-core/test/J0
[junit4] 2> 595532 T2153 oass.SolrDispatchFilter.init SolrDispatchFilter.init() done
[junit4] 2> 595595 T2153 oejs.Server.doStart jetty-8.1.10.v20130312
[junit4] 2> 595597 T2153 oejs.AbstractConnector.doStart Started SelectChannelConnector@127.0.0.1:58763
[junit4] 2> 595598 T2153 oass.SolrDispatchFilter.init SolrDispatchFilter.init()
[junit4] 2> 595598 T2153 oasc.SolrResourceLoader.locateSolrHome JNDI not configured for solr (NoInitialContextEx)
[junit4] 2> 595598 T2153 oasc.SolrResourceLoader.locateSolrHome using system property solr.solr.home: ./org.apache.solr.cloud.OverseerRolesTest-jetty2-1390074068039
[junit4] 2> 595599 T2153 oasc.SolrResourceLoader.<init> new SolrResourceLoader for directory: './org.apache.solr.cloud.OverseerRolesTest-jetty2-1390074068039/'
[junit4] 2> 595609 T2153 oasc.ConfigSolr.fromFile Loading container configuration from /mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build/solr-core/test/J0/./org.apache.solr.cloud.OverseerRolesTest-jetty2-1390074068039/solr.xml
[junit4] 2> 595641 T2153 oasc.ConfigSolrXml.<init> Config-defined core root directory:
[junit4] 2> 595642 T2153 oasc.CoreContainer.<init> New CoreContainer 13358358
[junit4] 2> 595642 T2153 oasc.CoreContainer.load Loading cores into CoreContainer [instanceDir=./org.apache.solr.cloud.OverseerRolesTest-jetty2-1390074068039/]
[junit4] 2> 595643 T2153 oashc.HttpShardHandlerFactory.getParameter Setting socketTimeout to: 90000
[junit4] 2> 595643 T2153 oashc.HttpShardHandlerFactory.getParameter Setting urlScheme to: http://
[junit4] 2> 595644 T2153 oashc.HttpShardHandlerFactory.getParameter Setting connTimeout to: 15000
[junit4] 2> 595644 T2153 oashc.HttpShardHandlerFactory.getParameter Setting maxConnectionsPerHost to: 20
[junit4] 2> 595644 T2153 oashc.HttpShardHandlerFactory.getParameter Setting corePoolSize to: 0
[junit4] 2> 595644 T2153 oashc.HttpShardHandlerFactory.getParameter Setting maximumPoolSize to: 2147483647
[junit4] 2> 595645 T2153 oashc.HttpShardHandlerFactory.getParameter Setting maxThreadIdleTime to: 5
[junit4] 2> 595645 T2153 oashc.HttpShardHandlerFactory.getParameter Setting sizeOfQueue to: -1
[junit4] 2> 595645 T2153 oashc.HttpShardHandlerFactory.getParameter Setting fairnessPolicy to: false
[junit4] 2> 595647 T2153 oasl.LogWatcher.createWatcher SLF4J impl is org.slf4j.impl.Log4jLoggerFactory
[junit4] 2> 595648 T2153 oasl.LogWatcher.newRegisteredLogWatcher Registering Log Listener [Log4j (org.slf4j.impl.Log4jLoggerFactory)]
[junit4] 2> 595648 T2153 oasc.CoreContainer.load Host Name: 127.0.0.1
[junit4] 2> 595648 T2153 oasc.ZkContainer.initZooKeeper Zookeeper client=127.0.0.1:59863/solr
[junit4] 2> 595649 T2153 oasc.ZkController.checkChrootPath zkHost includes chroot
[junit4] 2> 595649 T2153 oascc.ConnectionManager.waitForConnected Waiting for client to connect to ZooKeeper
[junit4] 2> 595651 T2205 oascc.ConnectionManager.process Watcher org.apache.solr.common.cloud.ConnectionManager@12a0fe name:ZooKeeperConnection Watcher:127.0.0.1:59863 got event WatchedEvent state:SyncConnected type:None path:null path:null type:None
[junit4] 2> 595652 T2153 oascc.ConnectionManager.waitForConnected Client is connected to ZooKeeper
[junit4] 2> 595653 T2153 oascc.ConnectionManager.waitForConnected Waiting for client to connect to ZooKeeper
[junit4] 2> 595655 T2207 oascc.ConnectionManager.process Watcher org.apache.solr.common.cloud.ConnectionManager@1e77d4 name:ZooKeeperConnection Watcher:127.0.0.1:59863/solr got event WatchedEvent state:SyncConnected type:None path:null path:null type:None
[junit4] 2> 595655 T2153 oascc.ConnectionManager.waitForConnected Client is connected to ZooKeeper
[junit4] 2> 595658 T2153 oascc.ZkStateReader.createClusterStateWatchersAndUpdate Updating cluster state from ZooKeeper...
[junit4] 2> 596661 T2153 oasc.ZkController.createEphemeralLiveNode Register node as live in ZooKeeper:/live_nodes/127.0.0.1:58763_
[junit4] 2> 596662 T2153 oascc.SolrZkClient.makePath makePath: /live_nodes/127.0.0.1:58763_
[junit4] 2> 596665 T2180 oascc.ZkStateReader$3.process Updating live nodes... (3)
[junit4] 2> 596665 T2193 oascc.ZkStateReader$3.process Updating live nodes... (3)
[junit4] 2> 596665 T2175 oascc.ZkStateReader$3.process Updating live nodes... (3)
[junit4] 2> 596665 T2207 oascc.ZkStateReader$3.process Updating live nodes... (3)
[junit4] 2> 596671 T2153 oasc.CorePropertiesLocator.discover Looking for core definitions underneath /mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build/solr-core/test/J0/./org.apache.solr.cloud.OverseerRolesTest-jetty2-1390074068039
[junit4] 2> 596672 T2153 oasc.CorePropertiesLocator.discoverUnder Found core conf in /mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build/solr-core/test/J0/./org.apache.solr.cloud.OverseerRolesTest-jetty2-1390074068039/conf/
[junit4] 2> 596692 T2153 oasc.CorePropertiesLocator.discover Found 1 core definitions
[junit4] 2> 596693 T2153 oass.SolrDispatchFilter.init user.dir=/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build/solr-core/test/J0
[junit4] 2> 596693 T2153 oass.SolrDispatchFilter.init SolrDispatchFilter.init() done
[junit4] 2> 596754 T2153 oejs.Server.doStart jetty-8.1.10.v20130312
[junit4] 2> 596756 T2153 oejs.AbstractConnector.doStart Started SelectChannelConnector@127.0.0.1:58042
[junit4] 2> 596757 T2153 oass.SolrDispatchFilter.init SolrDispatchFilter.init()
[junit4] 2> 596757 T2153 oasc.SolrResourceLoader.locateSolrHome JNDI not configured for solr (NoInitialContextEx)
[junit4] 2> 596758 T2153 oasc.SolrResourceLoader.locateSolrHome using system property solr.solr.home: ../../../../../../../../../../mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build/solr-core/test/J0/./org.apache.solr.cloud.OverseerRolesTest-jetty3-1390074069201
[junit4] 2> 596758 T2153 oasc.SolrResourceLoader.<init> new SolrResourceLoader for directory: '../../../../../../../../../../mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build/solr-core/test/J0/./org.apache.solr.cloud.OverseerRolesTest-jetty3-1390074069201/'
[junit4] 2> 596768 T2153 oasc.ConfigSolr.fromFile Loading container configuration from /mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build/solr-core/test/J0/../../../../../../../../../../mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build/solr-core/test/J0/./org.apache.solr.cloud.OverseerRolesTest-jetty3-1390074069201/solr.xml
[junit4] 2> 596800 T2153 oasc.ConfigSolrXml.<init> Config-defined core root directory:
[junit4] 2> 596801 T2153 oasc.CoreContainer.<init> New CoreContainer 13780395
[junit4] 2> 596801 T2153 oasc.CoreContainer.load Loading cores into CoreContainer [instanceDir=../../../../../../../../../../mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build/solr-core/test/J0/./org.apache.solr.cloud.OverseerRolesTest-jetty3-1390074069201/]
[junit4] 2> 596802 T2153 oashc.HttpShardHandlerFactory.getParameter Setting socketTimeout to: 90000
[junit4] 2> 596802 T2153 oashc.HttpShardHandlerFactory.getParameter Setting urlScheme to: http://
[junit4] 2> 596803 T2153 oashc.HttpShardHandlerFactory.getParameter Setting connTimeout to: 15000
[junit4] 2> 596803 T2153 oashc.HttpShardHandlerFactory.getParameter Setting maxConnectionsPerHost to: 20
[junit4] 2> 596803 T2153 oashc.HttpShardHandlerFactory.getParameter Setting corePoolSize to: 0
[junit4] 2> 596803 T2153 oashc.HttpShardHandlerFactory.getParameter Setting maximumPoolSize to: 2147483647
[junit4] 2> 596804 T2153 oashc.HttpShardHandlerFactory.getParameter Setting maxThreadIdleTime to: 5
[junit4] 2> 596804 T2153 oashc.HttpShardHandlerFactory.getParameter Setting sizeOfQueue to: -1
[junit4] 2> 596804 T2153 oashc.HttpShardHandlerFactory.getParameter Setting fairnessPolicy to: false
[junit4] 2> 596806 T2153 oasl.LogWatcher.createWatcher SLF4J impl is org.slf4j.impl.Log4jLoggerFactory
[junit4] 2> 596806 T2153 oasl.LogWatcher.newRegisteredLogWatcher Registering Log Listener [Log4j (org.slf4j.impl.Log4jLoggerFactory)]
[junit4] 2> 596807 T2153 oasc.CoreContainer.load Host Name: 127.0.0.1
[junit4] 2> 596807 T2153 oasc.ZkContainer.initZooKeeper Zookeeper client=127.0.0.1:59863/solr
[junit4] 2> 596807 T2153 oasc.ZkController.checkChrootPath zkHost includes chroot
[junit4] 2> 596808 T2153 oascc.ConnectionManager.waitForConnected Waiting for client to connect to ZooKeeper
[junit4] 2> 596809 T2219 oascc.ConnectionManager.process Watcher org.apache.solr.common.cloud.ConnectionManager@dbf697 name:ZooKeeperConnection Watcher:127.0.0.1:59863 got event WatchedEvent state:SyncConnected type:None path:null path:null type:None
[junit4] 2> 596809 T2153 oascc.ConnectionManager.waitForConnected Client is connected to ZooKeeper
[junit4] 2> 596811 T2153 oascc.ConnectionManager.waitForConnected Waiting for client to connect to ZooKeeper
[junit4] 2> 596812 T2221 oascc.ConnectionManager.process Watcher org.apache.solr.common.cloud.ConnectionManager@4da8c7 name:ZooKeeperConnection Watcher:127.0.0.1:59863/solr got event WatchedEvent state:SyncConnected type:None path:null path:null type:None
[junit4] 2> 596812 T2153 oascc.ConnectionManager.waitForConnected Client is connected to ZooKeeper
[junit4] 2> 596815 T2153 oascc.ZkStateReader.createClusterStateWatchersAndUpdate Updating cluster state from ZooKeeper...
[junit4] 2> 597817 T2153 oasc.ZkController.createEphemeralLiveNode Register node as live in ZooKeeper:/live_nodes/127.0.0.1:58042_
[junit4] 2> 597819 T2153 oascc.SolrZkClient.makePath makePath: /live_nodes/127.0.0.1:58042_
[junit4] 2> 597821 T2207 oascc.ZkStateReader$3.process Updating live nodes... (4)
[junit4] 2> 597821 T2221 oascc.ZkStateReader$3.process Updating live nodes... (4)
[junit4] 2> 597821 T2175 oascc.ZkStateReader$3.process Updating live nodes... (4)
[junit4] 2> 597821 T2193 oascc.ZkStateReader$3.process Updating live nodes... (4)
[junit4] 2> 597821 T2180 oascc.ZkStateReader$3.process Updating live nodes... (4)
[junit4] 2> 597825 T2153 oasc.CorePropertiesLocator.discover Looking for core definitions underneath /mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build/solr-core/test/J0/../../../../../../../../../../mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build/solr-core/test/J0/./org.apache.solr.cloud.OverseerRolesTest-jetty3-1390074069201
[junit4] 2> 597826 T2153 oasc.CorePropertiesLocator.discoverUnder Found core conf in /mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build/solr-core/test/J0/../../../../../../../../../../mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build/solr-core/test/J0/./org.apache.solr.cloud.OverseerRolesTest-jetty3-1390074069201/conf/
[junit4] 2> 597853 T2153 oasc.CorePropertiesLocator.discover Found 1 core definitions
[junit4] 2> 597854 T2153 oass.SolrDispatchFilter.init user.dir=/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build/solr-core/test/J0
[junit4] 2> 597854 T2153 oass.SolrDispatchFilter.init SolrDispatchFilter.init() done
[junit4] 2> 597916 T2153 oejs.Server.doStart jetty-8.1.10.v20130312
[junit4] 2> 597918 T2153 oejs.AbstractConnector.doStart Started SelectChannelConnector@127.0.0.1:57534
[junit4] 2> 597928 T2153 oass.SolrDispatchFilter.init SolrDispatchFilter.init()
[junit4] 2> 597929 T2153 oasc.SolrResourceLoader.locateSolrHome JNDI not configured for solr (NoInitialContextEx)
[junit4] 2> 597929 T2153 oasc.SolrResourceLoader.locateSolrHome using system property solr.solr.home: ./org.apache.solr.cloud.OverseerRolesTest-jetty4-1390074070362
[junit4] 2> 597929 T2153 oasc.SolrResourceLoader.<init> new SolrResourceLoader for directory: './org.apache.solr.cloud.OverseerRolesTest-jetty4-1390074070362/'
[junit4] 2> 597939 T2153 oasc.ConfigSolr.fromFile Loading container configuration from /mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build/solr-core/test/J0/./org.apache.solr.cloud.OverseerRolesTest-jetty4-1390074070362/solr.xml
[junit4] 2> 597971 T2153 oasc.ConfigSolrXml.<init> Config-defined core root directory:
[junit4] 2> 597971 T2153 oasc.CoreContainer.<init> New CoreContainer 20250590
[junit4] 2> 597971 T2153 oasc.CoreContainer.load Loading cores into CoreContainer [instanceDir=./org.apache.solr.cloud.OverseerRolesTest-jetty4-1390074070362/]
[junit4] 2> 597972 T2153 oashc.HttpShardHandlerFactory.getParameter Setting socketTimeout to: 90000
[junit4] 2> 597972 T2153 oashc.HttpShardHandlerFactory.getParameter Setting urlScheme to: http://
[junit4] 2> 597973 T2153 oashc.HttpShardHandlerFactory.getParameter Setting connTimeout to: 15000
[junit4] 2> 597973 T2153 oashc.HttpShardHandlerFactory.getParameter Setting maxConnectionsPerHost to: 20
[junit4] 2> 597973 T2153 oashc.HttpShardHandlerFactory.getParameter Setting corePoolSize to: 0
[junit4] 2> 597973 T2153 oashc.HttpShardHandlerFactory.getParameter Setting maximumPoolSize to: 2147483647
[junit4] 2> 597974 T2153 oashc.HttpShardHandlerFactory.getParameter Setting maxThreadIdleTime to: 5
[junit4] 2> 597974 T2153 oashc.HttpShardHandlerFactory.getParameter Setting sizeOfQueue to: -1
[junit4] 2> 597974 T2153 oashc.HttpShardHandlerFactory.getParameter Setting fairnessPolicy to: false
[junit4] 2> 597976 T2153 oasl.LogWatcher.createWatcher SLF4J impl is org.slf4j.impl.Log4jLoggerFactory
[junit4] 2> 597976 T2153 oasl.LogWatcher.newRegisteredLogWatcher Registering Log Listener [Log4j (org.slf4j.impl.Log4jLoggerFactory)]
[junit4] 2> 597977 T2153 oasc.CoreContainer.load Host Name: 127.0.0.1
[junit4] 2> 597977 T2153 oasc.ZkContainer.initZooKeeper Zookeeper client=127.0.0.1:59863/solr
[junit4] 2> 597977 T2153 oasc.ZkController.checkChrootPath zkHost includes chroot
[junit4] 2> 597978 T2153 oascc.ConnectionManager.waitForConnected Waiting for client to connect to ZooKeeper
[junit4] 2> 597979 T2233 oascc.ConnectionManager.process Watcher org.apache.solr.common.cloud.ConnectionManager@8a80dc name:ZooKeeperConnection Watcher:127.0.0.1:59863 got event WatchedEvent state:SyncConnected type:None path:null path:null type:None
[junit4] 2> 597979 T2153 oascc.ConnectionManager.waitForConnected Client is connected to ZooKeeper
[junit4] 2> 597981 T2153 oascc.ConnectionManager.waitForConnected Waiting for client to connect to ZooKeeper
[junit4] 2> 597982 T2235 oascc.ConnectionManager.process Watcher org.apache.solr.common.cloud.ConnectionManager@11d9cb1 name:ZooKeeperConnection Watcher:127.0.0.1:59863/solr got event WatchedEvent state:SyncConnected type:None path:null path:null type:None
[junit4] 2> 597983 T2153 oascc.ConnectionManager.waitForConnected Client is connected to ZooKeeper
[junit4] 2> 597986 T2153 oascc.ZkStateReader.createClusterStateWatchersAndUpdate Updating cluster state from ZooKeeper...
[junit4] 2> 598988 T2153 oasc.ZkController.createEphemeralLiveNode Register node as live in ZooKeeper:/live_nodes/127.0.0.1:57534_
[junit4] 2> 598991 T2153 oascc.SolrZkClient.makePath makePath: /live_nodes/127.0.0.1:57534_
[junit4] 2> 598993 T2193 oascc.ZkStateReader$3.process Updating live nodes... (5)
[junit4] 2> 598993 T2207 oascc.ZkStateReader$3.process Updating live nodes... (5)
[junit4] 2> 598993 T2180 oascc.ZkStateReader$3.process Updating live nodes... (5)
[junit4] 2> 598993 T2221 oascc.ZkStateReader$3.process Updating live nodes... (5)
[junit4] 2> 598993 T2175 oascc.ZkStateReader$3.process Updating live nodes... (5)
[junit4] 2> 598994 T2235 oascc.ZkStateReader$3.process Updating live nodes... (5)
[junit4] 2> 598999 T2153 oasc.CorePropertiesLocator.discover Looking for core definitions underneath /mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build/solr-core/test/J0/./org.apache.solr.cloud.OverseerRolesTest-jetty4-1390074070362
[junit4] 2> 599000 T2153 oasc.CorePropertiesLocator.discoverUnder Found core conf in /mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build/solr-core/test/J0/./org.apache.solr.cloud.OverseerRolesTest-jetty4-1390074070362/conf/
[junit4] 2> 599026 T2153 oasc.CorePropertiesLocator.discover Found 1 core definitions
[junit4] 2> 599026 T2153 oass.SolrDispatchFilter.init user.dir=/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build/solr-core/test/J0
[junit4] 2> 599027 T2153 oass.SolrDispatchFilter.init SolrDispatchFilter.init() done
[junit4] 2> 599088 T2153 oejs.Server.doStart jetty-8.1.10.v20130312
[junit4] 2> 599090 T2153 oejs.AbstractConnector.doStart Started SelectChannelConnector@127.0.0.1:54976
[junit4] 2> 599090 T2153 oass.SolrDispatchFilter.init SolrDispatchFilter.init()
[junit4] 2> 599091 T2153 oasc.SolrResourceLoader.locateSolrHome JNDI not configured for solr (NoInitialContextEx)
[junit4] 2> 599091 T2153 oasc.SolrResourceLoader.locateSolrHome using system property solr.solr.home: ../../../../../../../../../../mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build/solr-core/test/J0/./org.apache.solr.cloud.OverseerRolesTest-jetty5-1390074071534
[junit4] 2> 599091 T2153 oasc.SolrResourceLoader.<init> new SolrResourceLoader for directory: '../../../../../../../../../../mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build/solr-core/test/J0/./org.apache.solr.cloud.OverseerRolesTest-jetty5-1390074071534/'
[junit4] 2> 599101 T2153 oasc.ConfigSolr.fromFile Loading container configuration from /mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build/solr-core/test/J0/../../../../../../../../../../mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build/solr-core/test/J0/./org.apache.solr.cloud.OverseerRolesTest-jetty5-1390074071534/solr.xml
[junit4] 2> 599132 T2153 oasc.ConfigSolrXml.<init> Config-defined core root directory:
[junit4] 2> 599133 T2153 oasc.CoreContainer.<init> New CoreContainer 1298186
[junit4] 2> 599133 T2153 oasc.CoreContainer.load Loading cores into CoreContainer [instanceDir=../../../../../../../../../../mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build/solr-core/test/J0/./org.apache.solr.cloud.OverseerRolesTest-jetty5-1390074071534/]
[junit4] 2> 599134 T2153 oashc.HttpShardHandlerFactory.getParameter Setting socketTimeout to: 90000
[junit4] 2> 599134 T2153 oashc.HttpShardHandlerFactory.getParameter Setting urlScheme to: http://
[junit4] 2> 599135 T2153 oashc.HttpShardHandlerFactory.getParameter Setting connTimeout to: 15000
[junit4] 2> 599135 T2153 oashc.HttpShardHandlerFactory.getParameter Setting maxConnectionsPerHost to: 20
[junit4] 2> 599135 T2153 oashc.HttpShardHandlerFactory.getParameter Setting corePoolSize to: 0
[junit4] 2> 599135 T2153 oashc.HttpShardHandlerFactory.getParameter Setting maximumPoolSize to: 2147483647
[junit4] 2> 599136 T2153 oashc.HttpShardHandlerFactory.getParameter Setting maxThreadIdleTime to: 5
[junit4] 2> 599136 T2153 oashc.HttpShardHandlerFactory.getParameter Setting sizeOfQueue to: -1
[junit4] 2> 599136 T2153 oashc.HttpShardHandlerFactory.getParameter Setting fairnessPolicy to: false
[junit4] 2> 599138 T2153 oasl.LogWatcher.createWatcher SLF4J impl is org.slf4j.impl.Log4jLoggerFactory
[junit4] 2> 599138 T2153 oasl.LogWatcher.newRegisteredLogWatcher Registering Log Listener [Log4j (org.slf4j.impl.Log4jLoggerFactory)]
[junit4] 2> 599138 T2153 oasc.CoreContainer.load Host Name: 127.0.0.1
[junit4] 2> 599139 T2153 oasc.ZkContainer.initZooKeeper Zookeeper client=127.0.0.1:59863/solr
[junit4] 2> 599139 T2153 oasc.ZkController.checkChrootPath zkHost includes chroot
[junit4] 2> 599140 T2153 oascc.ConnectionManager.waitForConnected Waiting for client to connect to ZooKeeper
[junit4] 2> 599141 T2247 oascc.ConnectionManager.process Watcher org.apache.solr.common.cloud.ConnectionManager@7dbc70 name:ZooKeeperConnection Watcher:127.0.0.1:59863 got event WatchedEvent state:SyncConnected type:None path:null path:null type:None
[junit4] 2> 599141 T2153 oascc.ConnectionManager.waitForConnected Client is connected to ZooKeeper
[junit4] 2> 599143 T2153 oascc.ConnectionManager.waitForConnected Waiting for client to connect to ZooKeeper
[junit4] 2> 599144 T2249 oascc.ConnectionManager.process Watcher org.apache.solr.common.cloud.ConnectionManager@eeab77 name:ZooKeeperConnection Watcher:127.0.0.1:59863/solr got event WatchedEvent state:SyncConnected type:None path:null path:null type:None
[junit4] 2> 599144 T2153 oascc.ConnectionManager.waitForConnected Client is connected to ZooKeeper
[junit4] 2> 599147 T2153 oascc.ZkStateReader.createClusterStateWatchersAndUpdate Updating cluster state from ZooKeeper...
[junit4] 2> 600149 T2153 oasc.ZkController.createEphemeralLiveNode Register node as live in ZooKeeper:/live_nodes/127.0.0.1:54976_
[junit4] 2> 600150 T2153 oascc.SolrZkClient.makePath makePath: /live_nodes/127.0.0.1:54976_
[junit4] 2> 600153 T2180 oascc.ZkStateReader$3.process Updating live nodes... (6)
[junit4] 2> 600153 T2221 oascc.ZkStateReader$3.process Updating live nodes... (6)
[junit4] 2> 600153 T2249 oascc.ZkStateReader$3.process Updating live nodes... (6)
[junit4] 2> 600153 T2207 oascc.ZkStateReader$3.process Updating live nodes... (6)
[junit4] 2> 600153 T2193 oascc.ZkStateReader$3.process Updating live nodes... (6)
[junit4] 2> 600153 T2175 oascc.ZkStateReader$3.process Updating live nodes... (6)
[junit4] 2> 600153 T2235 oascc.ZkStateReader$3.process Updating live nodes... (6)
[junit4] 2> 600158 T2153 oasc.CorePropertiesLocator.discover Looking for core definitions underneath /mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build/solr-core/test/J0/../../../../../../../../../../mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build/solr-core/test/J0/./org.apache.solr.cloud.OverseerRolesTest-jetty5-1390074071534
[junit4] 2> 600159 T2153 oasc.CorePropertiesLocator.discoverUnder Found core conf in /mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build/solr-core/test/J0/../../../../../../../../../../mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build/solr-core/test/J0/./org.apache.solr.cloud.OverseerRolesTest-jetty5-1390074071534/conf/
[junit4] 2> 600187 T2153 oasc.CorePropertiesLocator.discover Found 1 core definitions
[junit4] 2> 600188 T2153 oass.SolrDispatchFilter.init user.dir=/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build/solr-core/test/J0
[junit4] 2> 600188 T2153 oass.SolrDispatchFilter.init SolrDispatchFilter.init() done
[junit4] 2> 600248 T2153 oejs.Server.doStart jetty-8.1.10.v20130312
[junit4] 2> 600249 T2153 oejs.AbstractConnector.doStart Started SelectChannelConnector@127.0.0.1:49512
[junit4] 2> 600250 T2153 oass.SolrDispatchFilter.init SolrDispatchFilter.init()
[junit4] 2> 600251 T2153 oasc.SolrResourceLoader.locateSolrHome JNDI not configured for solr (NoInitialContextEx)
[junit4] 2> 600251 T2153 oasc.SolrResourceLoader.locateSolrHome using system property solr.solr.home: ./org.apache.solr.cloud.OverseerRolesTest-jetty6-1390074072696
[junit4] 2> 600251 T2153 oasc.SolrResourceLoader.<init> new SolrResourceLoader for directory: './org.apache.solr.cloud.OverseerRolesTest-jetty6-1390074072696/'
[junit4] 2> 600261 T2153 oasc.ConfigSolr.fromFile Loading container configuration from /mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build/solr-core/test/J0/./org.apache.solr.cloud.OverseerRolesTest-jetty6-1390074072696/solr.xml
[junit4] 2> 600304 T2153 oasc.ConfigSolrXml.<init> Config-defined core root directory:
[junit4] 2> 600304 T2153 oasc.CoreContainer.<init> New CoreContainer 2889385
[junit4] 2> 600304 T2153 oasc.CoreContainer.load Loading cores into CoreContainer [instanceDir=./org.apache.solr.cloud.OverseerRolesTest-jetty6-1390074072696/]
[junit4] 2> 600305 T2153 oashc.HttpShardHandlerFactory.getParameter Setting socketTimeout to: 90000
[junit4] 2> 600306 T2153 oashc.HttpShardHandlerFactory.getParameter Setting urlScheme to: http://
[junit4] 2> 600306 T2153 oashc.HttpShardHandlerFactory.getParameter Setting connTimeout to: 15000
[junit4] 2> 600306 T2153 oashc.HttpShardHandlerFactory.getParameter Setting maxConnectionsPerHost to: 20
[junit4] 2> 600306 T2153 oashc.HttpShardHandlerFactory.getParameter Setting corePoolSize to: 0
[junit4] 2> 600307 T2153 oashc.HttpShardHandlerFactory.getParameter Setting maximumPoolSize to: 2147483647
[junit4] 2> 600307 T2153 oashc.HttpShardHandlerFactory.getParameter Setting maxThreadIdleTime to: 5
[junit4] 2> 600307 T2153 oashc.HttpShardHandlerFactory.getParameter Setting sizeOfQueue to: -1
[junit4] 2> 600307 T2153 oashc.HttpShardHandlerFactory.getParameter Setting fairnessPolicy to: false
[junit4] 2> 600309 T2153 oasl.LogWatcher.createWatcher SLF4J impl is org.slf4j.impl.Log4jLoggerFactory
[junit4] 2> 600310 T2153 oasl.LogWatcher.newRegisteredLogWatcher Registering Log Listener [Log4j (org.slf4j.impl.Log4jLoggerFactory)]
[junit4] 2> 600310 T2153 oasc.CoreContainer.load Host Name: 127.0.0.1
[junit4] 2> 600310 T2153 oasc.ZkContainer.initZooKeeper Zookeeper client=127.0.0.1:59863/solr
[junit4] 2> 600311 T2153 oasc.ZkController.checkChrootPath zkHost includes chroot
[junit4] 2> 600311 T2153 oascc.ConnectionManager.waitForConnected Waiting for client to connect to ZooKeeper
[junit4] 2> 600313 T2261 oascc.ConnectionManager.process Watcher org.apache.solr.common.cloud.ConnectionManager@83bda4 name:ZooKeeperConnection Watcher:127.0.0.1:59863 got event WatchedEvent state:SyncConnected type:None path:null path:null type:None
[junit4] 2> 600313 T2153 oascc.ConnectionManager.waitForConnected Client is connected to ZooKeeper
[junit4] 2> 600314 T2153 oascc.ConnectionManager.waitForConnected Waiting for client to connect to ZooKeeper
[junit4] 2> 600316 T2263 oascc.ConnectionManager.process Watcher org.apache.solr.common.cloud.ConnectionManager@898114 name:ZooKeeperConnection Watcher:127.0.0.1:59863/solr got event WatchedEvent state:SyncConnected type:None path:null path:null type:None
[junit4] 2> 600316 T2153 oascc.ConnectionManager.waitForConnected Client is connected to ZooKeeper
[junit4] 2> 600319 T2153 oascc.ZkStateReader.createClusterStateWatchersAndUpdate Updating cluster state from ZooKeeper...
[junit4] 2> 601321 T2153 oasc.ZkController.createEphemeralLiveNode Register node as live in ZooKeeper:/live_nodes/127.0.0.1:49512_
[junit4] 2> 601323 T2153 oascc.SolrZkClient.makePath makePath: /live_nodes/127.0.0.1:49512_
[junit4] 2> 601326 T2193 oascc.ZkStateReader$3.process Updating live nodes... (7)
[junit4] 2> 601326 T2249 oascc.ZkStateReader$3.process Updating live nodes... (7)
[junit4] 2> 601326 T2221 oascc.ZkStateReader$3.process Updating live nodes... (7)
[junit4] 2> 601326 T2175 oascc.ZkStateReader$3.process Updating live nodes... (7)
[junit4] 2> 601326 T2235 oascc.ZkStateReader$3.process Updating live nodes... (7)
[junit4] 2> 601326 T2263 oascc.ZkStateReader$3.process Updating live nodes... (7)
[junit4] 2> 601326 T2207 oascc.ZkStateReader$3.process Updating live nodes... (7)
[junit4] 2> 601326 T2180 oascc.ZkStateReader$3.process Updating live nodes... (7)
[junit4] 2> 601330 T2153 oasc.CorePropertiesLocator.discover Looking for core definitions underneath /mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build/solr-core/test/J0/./org.apache.solr.cloud.OverseerRolesTest-jetty6-1390074072696
[junit4] 2> 601331 T2153 oasc.CorePropertiesLocator.discoverUnder Found core conf in /mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build/solr-core/test/J0/./org.apache.solr.cloud.OverseerRolesTest-jetty6-1390074072696/conf/
[junit4] 2> 601351 T2153 oasc.CorePropertiesLocator.discover Found 1 core definitions
[junit4] 2> 601352 T2153 oass.SolrDispatchFilter.init user.dir=/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build/solr-core/test/J0
[junit4] 2> 601352 T2153 oass.SolrDispatchFilter.init SolrDispatchFilter.init() done
[junit4] 2> 601353 T2153 oascc.ConnectionManager.waitForConnected Waiting for client to connect to ZooKeeper
[junit4] 2> 601354 T2266 oascc.ConnectionManager.process Watcher org.apache.solr.common.cloud.ConnectionManager@17db3ab name:ZooKeeperConnection Watcher:127.0.0.1:59863/solr got event WatchedEvent state:SyncConnected type:None path:null path:null type:None
[junit4] 2> 601354 T2153 oascc.ConnectionManager.waitForConnected Client is connected to ZooKeeper
[junit4] 2> 601356 T2153 oascc.ZkStateReader.createClusterStateWatchersAndUpdate Updating cluster state from ZooKeeper...
[junit4] 2> 601358 T2153 oascc.ConnectionManager.waitForConnected Waiting for client to connect to ZooKeeper
[junit4] 2> 601359 T2268 oascc.ConnectionManager.process Watcher org.apache.solr.common.cloud.ConnectionManager@16a5b9d name:ZooKeeperConnection Watcher:127.0.0.1:59863/solr got event WatchedEvent state:SyncConnected type:None path:null path:null type:None
[junit4] 2> 601359 T2153 oascc.ConnectionManager.waitForConnected Client is connected to ZooKeeper
[junit4] 2> 601360 T2153 oascc.ZkStateReader.createClusterStateWatchersAndUpdate Updating cluster state from ZooKeeper...
[junit4] 2> 601362 T2214 oasha.CollectionsHandler.handleCreateAction Creating Collection : action=CREATE&wt=javabin&numShards=4&maxShardsPerNode=2&name=testOverseerCol&version=2&replicationFactor=2
[junit4] 2> 601364 T2175 oasc.DistributedQueue$LatchChildWatcher.process LatchChildWatcher fired on path: /overseer/collection-queue-work state: SyncConnected type NodeChildrenChanged
[junit4] 2> 601365 T2177 oasc.OverseerCollectionProcessor.run Overseer Collection Processor: Get the message id:/overseer/collection-queue-work/qn-0000000000 message:{
[junit4] 2> "operation":"createcollection",
[junit4] 2> "fromApi":"true",
[junit4] 2> "name":"testOverseerCol",
[junit4] 2> "replicationFactor":"2",
[junit4] 2> "numShards":"4",
[junit4] 2> "maxShardsPerNode":"2"}
[junit4] 2> 601365 T2177 oasc.OverseerCollectionProcessor.processMessage WARN OverseerCollectionProcessor.processMessage : createcollection , {
[junit4] 2> "operation":"createcollection",
[junit4] 2> "fromApi":"true",
[junit4] 2> "name":"testOverseerCol",
[junit4] 2> "replicationFactor":"2",
[junit4] 2> "numShards":"4",
[junit4] 2> "maxShardsPerNode":"2"}
[junit4] 2> 601365 T2177 oasc.OverseerCollectionProcessor.createConfNode Only one config set found in zk - using it:conf1
[junit4] 2> 601365 T2177 oasc.OverseerCollectionProcessor.createConfNode creating collections conf node /collections/testOverseerCol
[junit4] 2> 601365 T2177 oascc.SolrZkClient.makePath makePath: /collections/testOverseerCol
[junit4] 2> 601368 T2175 oasc.DistributedQueue$LatchChildWatcher.process LatchChildWatcher fired on path: /overseer/queue state: SyncConnected type NodeChildrenChanged
[junit4] 2> 601369 T2176 oascc.ZkStateReader.updateClusterState Updating cloud state from ZooKeeper...
[junit4] 2> 601370 T2176 oasc.Overseer$ClusterStateUpdater.buildCollection building a new collection: testOverseerCol
[junit4] 2> 601370 T2176 oasc.Overseer$ClusterStateUpdater.createCollection Create collection testOverseerCol with shards [shard1, shard2, shard3, shard4]
[junit4] 2> 601372 T2175 oasc.DistributedQueue$LatchChildWatcher.process LatchChildWatcher fired on path: /overseer/queue state: SyncConnected type NodeChildrenChanged
[junit4] 2> 601372 T2235 oascc.ZkStateReader$2.process A cluster state change: WatchedEvent state:SyncConnected type:NodeDataChanged path:/clusterstate.json, has occurred - updating... (live nodes size: 7)
[junit4] 2> 601372 T2263 oascc.ZkStateReader$2.process A cluster state change: WatchedEvent state:SyncConnected type:NodeDataChanged path:/clusterstate.json, has occurred - updating... (live nodes size: 7)
[junit4] 2> 601372 T2249 oascc.ZkStateReader$2.process A cluster state change: WatchedEvent state:SyncConnected type:NodeDataChanged path:/clusterstate.json, has occurred - updating... (live nodes size: 7)
[junit4] 2> 601372 T2193 oascc.ZkStateReader$2.process A cluster state change: WatchedEvent state:SyncConnected type:NodeDataChanged path:/clusterstate.json, has occurred - updating... (live nodes size: 7)
[junit4] 2> 601372 T2221 oascc.ZkStateReader$2.process A cluster state change: WatchedEvent state:SyncConnected type:NodeDataChanged path:/clusterstate.json, has occurred - updating... (live nodes size: 7)
[junit4] 2> 601372 T2207 oascc.ZkStateReader$2.process A cluster state change: WatchedEvent state:SyncConnected type:NodeDataChanged path:/clusterstate.json, has occurred - updating... (live nodes size: 7)
[junit4] 2> 601372 T2180 oascc.ZkStateReader$2.process A cluster state change: WatchedEvent state:SyncConnected type:NodeDataChanged path:/clusterstate.json, has occurred - updating... (live nodes size: 7)
[junit4] 2> 601372 T2266 oascc.ZkStateReader$2.process A cluster state change: WatchedEvent state:SyncConnected type:NodeDataChanged path:/clusterstate.json, has occurred - updating... (live nodes size: 7)
[junit4] 2> 601372 T2268 oascc.ZkStateReader$2.process A cluster state change: WatchedEvent state:SyncConnected type:NodeDataChanged path:/clusterstate.json, has occurred - updating... (live nodes size: 7)
[junit4] 2> 601372 T2175 oascc.ZkStateReader$2.process A cluster state change: WatchedEvent state:SyncConnected type:NodeDataChanged path:/clusterstate.json, has occurred - updating... (live nodes size: 7)
[junit4] 2> 601468 T2177 oasc.OverseerCollectionProcessor.createCollection going to create cores replicas shardNames [shard1, shard2, shard3, shard4] , repFactor : 2
[junit4] 2> 601469 T2177 oasc.OverseerCollectionProcessor.createCollection Creating shard testOverseerCol_shard1_replica1 as part of slice shard1 of collection testOverseerCol on 127.0.0.1:54976_
[junit4] 2> 601469 T2177 oasc.OverseerCollectionProcessor.createCollection Creating shard testOverseerCol_shard1_replica2 as part of slice shard1 of collection testOverseerCol on 127.0.0.1:57534_
[junit4] 2> 601469 T2177 oasc.OverseerCollectionProcessor.createCollection Creating shard testOverseerCol_shard2_replica1 as part of slice shard2 of collection testOverseerCol on 127.0.0.1:56902_
[junit4] 2> 601470 T2177 oasc.OverseerCollectionProcessor.createCollection Creating shard testOverseerCol_shard2_replica2 as part of slice shard2 of collection testOverseerCol on 127.0.0.1:60106_
[junit4] 2> 601471 T2177 oasc.OverseerCollectionProcessor.createCollection Creating shard testOverseerCol_shard3_replica1 as part of slice shard3 of collection testOverseerCol on 127.0.0.1:58042_
[junit4] 2> 601471 T2177 oasc.OverseerCollectionProcessor.createCollection Creating shard testOverseerCol_shard3_replica2 as part of slice shard3 of collection testOverseerCol on 127.0.0.1:58763_
[junit4] 2> 601472 T2177 oasc.OverseerCollectionProcessor.createCollection Creating shard testOverseerCol_shard4_replica1 as part of slice shard4 of collection testOverseerCol on 127.0.0.1:49512_
[junit4] 2> 601472 T2177 oasc.OverseerCollectionProcessor.createCollection Creating shard testOverseerCol_shard4_replica2 as part of slice shard4 of collection testOverseerCol on 127.0.0.1:54976_
[junit4] 2> 601474 T2200 oasc.ZkController.publish publishing core=testOverseerCol_shard3_replica2 state=down
[junit4] 2> 601474 T2245 oasc.ZkController.publish publishing core=testOverseerCol_shard4_replica2 state=down
[junit4] 2> 601475 T2257 oasc.ZkController.publish publishing core=testOverseerCol_shard4_replica1 state=down
[junit4] 2> 601475 T2228 oasc.ZkController.publish publishing core=testOverseerCol_shard1_replica2 state=down
[junit4] 2> 601474 T2244 oasc.ZkController.publish publishing core=testOverseerCol_shard1_replica1 state=down
[junit4] 2> 601476 T2245 oasc.ZkController.waitForCoreNodeName look for our core node name
[junit4] 2> 601476 T2257 oasc.ZkController.waitForCoreNodeName look for our core node name
[junit4] 2> 601474 T2189 oasc.ZkController.publish publishing core=testOverseerCol_shard2_replica1 state=down
[junit4] 2> 601476 T2200 oasc.ZkController.waitForCoreNodeName look for our core node name
[junit4] 2> 601477 T2244 oasc.ZkController.waitForCoreNodeName look for our core node name
[junit4] 2> 601475 T2175 oasc.DistributedQueue$LatchChildWatcher.process LatchChildWatcher fired on path: /overseer/queue state: SyncConnected type NodeChildrenChanged
[junit4] 2> 601475 T2215 oasc.ZkController.publish publishing core=testOverseerCol_shard3_replica1 state=down
[junit4] 2> 601475 T2168 oasc.ZkController.publish publishing core=testOverseerCol_shard2_replica2 state=down
[junit4] 2> 601477 T2189 oasc.ZkController.waitForCoreNodeName look for our core node name
[junit4] 2> 601478 T2215 oasc.ZkController.waitForCoreNodeName look for our core node name
[junit4] 2> 601477 T2228 oasc.ZkController.waitForCoreNodeName look for our core node name
[junit4] 2> 601479 T2168 oasc.ZkController.waitForCoreNodeName look for our core node name
[junit4] 2> 601479 T2175 oasc.DistributedQueue$LatchChildWatcher.process LatchChildWatcher fired on path: /overseer/queue state: SyncConnected type NodeChildrenChanged
[junit4] 2> 601479 T2176 oascc.ZkStateReader.updateClusterState Updating cloud state from ZooKeeper...
[junit4] 2> 601480 T2176 oasc.Overseer$ClusterStateUpdater.updateState Update state numShards=4 message={
[junit4] 2> "operation":"state",
[junit4] 2> "state":"down",
[junit4] 2> "base_url":"http://127.0.0.1:58763",
[junit4] 2> "core":"testOverseerCol_shard3_replica2",
[junit4] 2> "roles":null,
[junit4] 2> "node_name":"127.0.0.1:58763_",
[junit4] 2> "shard":"shard3",
[junit4] 2> "shard_range":null,
[junit4] 2> "shard_state":"active",
[junit4] 2> "shard_parent":null,
[junit4] 2> "collection":"testOverseerCol",
[junit4] 2> "numShards":"4",
[junit4] 2> "core_node_name":null}
[junit4] 2> 601482 T2176 oasc.Overseer$ClusterStateUpdater.updateState Update state numShards=4 message={
[junit4] 2> "operation":"state",
[junit4] 2> "state":"down",
[junit4] 2> "base_url":"http://127.0.0.1:54976",
[junit4] 2> "core":"testOverseerCol_shard4_replica2",
[junit4] 2> "roles":null,
[junit4] 2> "node_name":"127.0.0.1:54976_",
[junit4] 2> "shard":"shard4",
[junit4] 2> "shard_range":null,
[junit4] 2> "shard_state":"active",
[junit4] 2> "shard_parent":null,
[junit4] 2> "collection":"testOverseerCol",
[junit4] 2> "numShards":"4",
[junit4] 2> "core_node_name":null}
[junit4] 2> 601484 T2175 oasc.DistributedQueue$LatchChildWatcher.process LatchChildWatcher fired on path: /overseer/queue state: SyncConnected type NodeChildrenChanged
[junit4] 2> 601485 T2176 oasc.Overseer$ClusterStateUpdater.updateState Update state numShards=4 message={
[junit4] 2> "operation":"state",
[junit4] 2> "state":"down",
[junit4] 2> "base_url":"http://127.0.0.1:49512",
[junit4] 2> "core":"testOverseerCol_shard4_replica1",
[junit4] 2> "roles":null,
[junit4] 2> "node_name":"127.0.0.1:49512_",
[junit4] 2> "shard":"shard4",
[junit4] 2> "shard_range":null,
[junit4] 2> "shard_state":"active",
[junit4] 2> "shard_parent":null,
[junit4] 2> "collection":"testOverseerCol",
[junit4] 2> "numShards":"4",
[junit4] 2> "core_node_name":null}
[junit4] 2> 601488 T2175 oasc.DistributedQueue$LatchChildWatcher.process LatchChildWatcher fired on path: /overseer/queue state: SyncConnected type NodeChildrenChanged
[junit4] 2> 601489 T2176 oasc.Overseer$ClusterStateUpdater.updateState Update state numShards=4 message={
[junit4] 2> "operation":"state",
[junit4] 2> "state":"down",
[junit4] 2> "base_url":"http://127.0.0.1:57534",
[junit4] 2> "core":"testOverseerCol_shard1_replica2",
[junit4] 2> "roles":null,
[junit4] 2> "node_name":"127.0.0.1:57534_",
[junit4] 2> "shard":"shard1",
[junit4] 2> "shard_range":null,
[junit4] 2> "shard_state":"active",
[junit4] 2> "shard_parent":null,
[junit4] 2> "collection":"testOverseerCol",
[junit4] 2> "numShards":"4",
[junit4] 2> "core_node_name":null}
[junit4] 2> 601490 T2175 oasc.DistributedQueue$LatchChildWatcher.process LatchChildWatcher fired on path: /overseer/queue state: SyncConnected type NodeChildrenChanged
[junit4] 2> 601491 T2176 oasc.Overseer$ClusterStateUpdater.updateState Update state numShards=4 message={
[junit4] 2> "operation":"state",
[junit4] 2> "state":"down",
[junit4] 2> "base_url":"http://127.0.0.1:54976",
[junit4] 2> "core":"testOverseerCol_shard1_replica1",
[junit4] 2> "roles":null,
[junit4] 2> "node_name":"127.0.0.1:54976_",
[junit4] 2> "shard":"shard1",
[junit4] 2> "shard_range":null,
[junit4] 2> "shard_state":"active",
[junit4] 2> "shard_parent":null,
[junit4] 2> "collection":"testOverseerCol",
[junit4] 2> "numShards":"4",
[junit4] 2> "core_node_name":null}
[junit4] 2> 601493 T2175 oasc.DistributedQueue$LatchChildWatcher.process LatchChildWatcher fired on path: /overseer/queue state: SyncConnected type NodeChildrenChanged
[junit4] 2> 601493 T2176 oasc.Overseer$ClusterStateUpdater.updateState Update state numShards=4 message={
[junit4] 2> "operation":"state",
[junit4] 2> "state":"down",
[junit4] 2> "base_url":"http://127.0.0.1:56902",
[junit4] 2> "core":"testOverseerCol_shard2_replica1",
[junit4] 2> "roles":null,
[junit4] 2> "node_name":"127.0.0.1:56902_",
[junit4] 2> "shard":"shard2",
[junit4] 2> "shard_range":null,
[junit4] 2> "shard_state":"active",
[junit4] 2> "shard_parent":null,
[junit4] 2> "collection":"testOverseerCol",
[junit4] 2> "numShards":"4",
[junit4] 2> "core_node_name":null}
[junit4] 2> 601495 T2175 oasc.DistributedQueue$LatchChildWatcher.process LatchChildWatcher fired on path: /overseer/queue state: SyncConnected type NodeChildrenChanged
[junit4] 2> 601495 T2176 oasc.Overseer$ClusterStateUpdater.updateState Update state numShards=4 message={
[junit4] 2> "operation":"state",
[junit4] 2> "state":"down",
[junit4] 2> "base_url":"http://127.0.0.1:58042",
[junit4] 2> "core":"testOverseerCol_shard3_replica1",
[junit4] 2> "roles":null,
[junit4] 2> "node_name":"127.0.0.1:58042_",
[junit4] 2> "shard":"shard3",
[junit4] 2> "shard_range":null,
[junit4] 2> "shard_state":"active",
[junit4] 2> "shard_parent":null,
[junit4] 2> "collection":"testOverseerCol",
[junit4] 2> "numShards":"4",
[junit4] 2> "core_node_name":null}
[junit4] 2> 601497 T2175 oasc.DistributedQueue$LatchChildWatcher.process LatchChildWatcher fired on path: /overseer/queue state: SyncConnected type NodeChildrenChanged
[junit4] 2> 601498 T2176 oasc.Overseer$ClusterStateUpdater.updateState Update state numShards=4 message={
[junit4] 2> "operation":"state",
[junit4] 2> "state":"down",
[junit4] 2> "base_url":"http://127.0.0.1:60106",
[junit4] 2> "core":"testOverseerCol_shard2_replica2",
[junit4] 2> "roles":null,
[junit4] 2> "node_name":"127.0.0.1:60106_",
[junit4] 2> "shard":"shard2",
[junit4] 2> "shard_range":null,
[junit4] 2> "shard_state":"active",
[junit4] 2> "shard_parent":null,
[junit4] 2> "collection":"testOverseerCol",
[junit4] 2> "numShards":"4",
[junit4] 2> "core_node_name":null}
[junit4] 2> 601499 T2175 oasc.DistributedQueue$LatchChildWatcher.process LatchChildWatcher fired on path: /overseer/queue state: SyncConnected type NodeChildrenChanged
[junit4] 2> 601601 T2175 oascc.ZkStateReader$2.process A cluster state change: WatchedEvent state:SyncConnected type:NodeDataChanged path:/clusterstate.json, has occurred - updating... (live nodes size: 7)
[junit4] 2> 601601 T2180 oascc.ZkStateReader$2.process A cluster state change: WatchedEvent state:SyncConnected type:NodeDataChanged path:/clusterstate.json, has occurred - updating... (live nodes size: 7)
[junit4] 2> 601601 T2193 oascc.ZkStateReader$2.process A cluster state change: WatchedEvent state:SyncConnected type:NodeDataChanged path:/clusterstate.json, has occurred - updating... (live nodes size: 7)
[junit4] 2> 601601 T2221 oascc.ZkStateReader$2.process A cluster state change: WatchedEvent state:SyncConnected type:NodeDataChanged path:/clusterstate.json, has occurred - updating... (live nodes size: 7)
[junit4] 2> 601601 T2249 oascc.ZkStateReader$2.process A cluster state change: WatchedEvent state:SyncConnected type:NodeDataChanged path:/clusterstate.json, has occurred - updating... (live nodes size: 7)
[junit4] 2> 601601 T2268 oascc.ZkStateReader$2.process A cluster state change: WatchedEvent state:SyncConnected type:NodeDataChanged path:/clusterstate.json, has occurred - updating... (live nodes size: 7)
[junit4] 2> 601601 T2207 oascc.ZkStateReader$2.process A cluster state change: WatchedEvent state:SyncConnected type:NodeDataChanged path:/clusterstate.json, has occurred - updating... (live nodes size: 7)
[junit4] 2> 601601 T2263 oascc.ZkStateReader$2.process A cluster state change: WatchedEvent state:SyncConnected type:NodeDataChanged path:/clusterstate.json, has occurred - updating... (live nodes size: 7)
[junit4] 2> 601601 T2266 oascc.ZkStateReader$2.process A cluster state change: WatchedEvent state:SyncConnected type:NodeDataChanged path:/clusterstate.json, has occurred - updating... (live nodes size: 7)
[junit4] 2> 601601 T2235 oascc.ZkStateReader$2.process A cluster state change: WatchedEvent state:SyncConnected type:NodeDataChanged path:/clusterstate.json, has occurred - updating... (live nodes size: 7)
[junit4] 2> 602476 T2245 oasc.ZkController.waitForShardId waiting to find shard id in clusterstate for testOverseerCol_shard4_replica2
[junit4] 2> 602476 T2257 oasc.ZkController.waitForShardId waiting to find shard id in clusterstate for testOverseerCol_shard4_replica1
[junit4] 2> 602477 T2200 oasc.ZkController.waitForShardId waiting to find shard id in clusterstate for testOverseerCol_shard3_replica2
[junit4] 2> 602477 T2244 oasc.ZkController.waitForShardId waiting to find shard id in clusterstate for testOverseerCol_shard1_replica1
[junit4] 2> 602477 T2245 oasc.CoreContainer.create Creating SolrCore 'testOverseerCol_shard4_replica2' using instanceDir: ../../../../../../../../../../mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build/solr-core/test/J0/./org.apache.solr.cloud.OverseerRolesTest-jetty5-1390074071534/testOverseerCol_shard4_replica2
[junit4] 2> 602478 T2245 oasc.ZkController.createCollectionZkNode Check for collection zkNode:testOverseerCol
[junit4] 2> 602477 T2257 oasc.CoreContainer.create Creating SolrCore 'testOverseerCol_shard4_replica1' using instanceDir: ./org.apache.solr.cloud.OverseerRolesTest-jetty6-1390074072696/testOverseerCol_shard4_replica1
[junit4] 2> 602478 T2257 oasc.ZkController.createCollectionZkNode Check for collection zkNode:testOverseerCol
[junit4] 2> 602478 T2189 oasc.ZkController.waitForShardId waiting to find shard id in clusterstate for testOverseerCol_shard2_replica1
[junit4] 2> 602479 T2257 oasc.ZkController.createCollectionZkNode Collection zkNode exists
[junit4] 2> 602479 T2257 oascc.ZkStateReader.readConfigName Load collection config from:/collections/testOverseerCol
[junit4] 2> 602478 T2244 oasc.CoreContainer.create Creating SolrCore 'testOverseerCol_shard1_replica1' using instanceDir: ../../../../../../../../../../mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build/solr-core/test/J0/./org.apache.solr.cloud.OverseerRolesTest-jetty5-1390074071534/testOverseerCol_shard1_replica1
[junit4] 2> 602478 T2200 oasc.CoreContainer.create Creating SolrCore 'testOverseerCol_shard3_replica2' using instanceDir: ./org.apache.solr.cloud.OverseerRolesTest-jetty2-1390074068039/testOverseerCol_shard3_replica2
[junit4] 2> 602480 T2200 oasc.ZkController.createCollectionZkNode Check for collection zkNode:testOverseerCol
[junit4] 2> 602480 T2244 oasc.ZkController.createCollectionZkNode Check for collection zkNode:testOverseerCol
[junit4] 2> 602479 T2189 oasc.CoreContainer.create Creating SolrCore 'testOverseerCol_shard2_replica1' using instanceDir: ./org.apache.solr.cloud.OverseerRolesTest-jetty1-1390074066884/testOverseerCol_shard2_replica1
[junit4] 2> 602479 T2168 oasc.ZkController.waitForShardId waiting to find shard id in clusterstate for testOverseerCol_shard2_replica2
[junit4] 2> 602479 T2228 oasc.ZkController.waitForShardId waiting to find shard id in clusterstate for testOverseerCol_shard1_replica2
[junit4] 2> 602479 T2245 oasc.ZkController.createCollectionZkNode Collection zkNode exists
[junit4] 2> 602482 T2245 oascc.ZkStateReader.readConfigName Load collection config from:/collections/testOverseerCol
[junit4] 2> 602479 T2215 oasc.ZkController.waitForShardId waiting to find shard id in clusterstate for testOverseerCol_shard3_replica1
[junit4] 2> 602482 T2228 oasc.CoreContainer.create Creating SolrCore 'testOverseerCol_shard1_replica2' using instanceDir: ./org.apache.solr.cloud.OverseerRolesTest-jetty4-1390074070362/testOverseerCol_shard1_replica2
[junit4] 2> 602482 T2168 oasc.CoreContainer.create Creating SolrCore 'testOverseerCol_shard2_replica2' using instanceDir: ../../../../../../../../../../mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build/solr-core/test/J0/./org.apache.solr.cloud.OverseerRolesTest-controljetty-1390074066689/testOverseerCol_shard2_replica2
[junit4] 2> 602481 T2189 oasc.ZkController.createCollectionZkNode Check for collection zkNode:testOverseerCol
[junit4] 2> 602481 T2244 oasc.ZkController.createCollectionZkNode Collection zkNode exists
[junit4] 2> 602483 T2189 oasc.ZkController.createCollectionZkNode Collection zkNode exists
[junit4] 2> 602483 T2189 oascc.ZkStateReader.readConfigName Load collection config from:/collections/testOverseerCol
[junit4] 2> 602481 T2200 oasc.ZkController.createCollectionZkNode Collection zkNode exists
[junit4] 2> 602484 T2200 oascc.ZkStateReader.readConfigName Load collection config from:/collections/testOverseerCol
[junit4] 2> 602484 T2189 oasc.SolrResourceLoader.<init> new SolrResourceLoader for directory: './org.apache.solr.cloud.OverseerRolesTest-jetty1-1390074066884/testOverseerCol_shard2_replica1/'
[junit4] 2> 602480 T2257 oasc.SolrResourceLoader.<init> new SolrResourceLoader for directory: './org.apache.solr.cloud.OverseerRolesTest-jetty6-1390074072696/testOverseerCol_shard4_replica1/'
[junit4] 2> 602483 T2244 oascc.ZkStateReader.readConfigName Load collection config from:/collections/testOverseerCol
[junit4] 2> 602483 T2215 oasc.CoreContainer.create Creating SolrCore 'testOverseerCol_shard3_replica1' using instanceDir: ../../../../../../../../../../mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build/solr-core/test/J0/./org.apache.solr.cloud.OverseerRolesTest-jetty3-1390074069201/testOverseerCol_shard3_replica1
[junit4] 2> 602485 T2215 oasc.ZkController.createCollectionZkNode Check for collection zkNode:testOverseerCol
[junit4] 2> 602483 T2168 oasc.ZkController.createCollectionZkNode Check for collection zkNode:testOverseerCol
[junit4] 2> 602482 T2228 oasc.ZkController.createCollectionZkNode Check for collection zkNode:testOverseerCol
[junit4] 2> 602482 T2245 oasc.SolrResourceLoader.<init> new SolrResourceLoader for directory: '../../../../../../../../../../mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build/solr-core/test/J0/./org.apache.solr.cloud.OverseerRolesTest-jetty5-1390074071534/testOverseerCol_shard4_replica2/'
[junit4] 2> 602486 T2168 oasc.ZkController.createCollectionZkNode Collection zkNode exists
[junit4] 2> 602486 T2215 oasc.ZkController.createCollectionZkNode Collection zkNode exists
[junit4] 2> 602487 T2228 oasc.ZkController.createCollectionZkNode Collection zkNode exists
[junit4] 2> 602487 T2228 oascc.ZkStateReader.readConfigName Load collection config from:/collections/testOverseerCol
[junit4] 2> 602486 T2244 oasc.SolrResourceLoader.<init> new SolrResourceLoader for directory: '../../../../../../../../../../mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build/solr-core/test/J0/./org.apache.solr.cloud.OverseerRolesTest-jetty5-1390074071534/testOverseerCol_shard1_replica1/'
[junit4] 2> 602485 T2200 oasc.SolrResourceLoader.<init> new SolrResourceLoader for directory: './org.apache.solr.cloud.OverseerRolesTest-jetty2-1390074068039/testOverseerCol_shard3_replica2/'
[junit4] 2> 602487 T2215 oascc.ZkStateReader.readConfigName Load collection config from:/collections/testOverseerCol
[junit4] 2> 602487 T2168 oascc.ZkStateReader.readConfigName Load collection config from:/collections/testOverseerCol
[junit4] 2> 602489 T2228 oasc.SolrResourceLoader.<init> new SolrResourceLoader for directory: './org.apache.solr.cloud.OverseerRolesTest-jetty4-1390074070362/testOverseerCol_shard1_replica2/'
[junit4] 2> 602491 T2168 oasc.SolrResourceLoader.<init> new SolrResourceLoader for directory: '../../../../../../../../../../mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build/solr-core/test/J0/./org.apache.solr.cloud.OverseerRolesTest-controljetty-1390074066689/testOverseerCol_shard2_replica2/'
[junit4] 2> 602492 T2215 oasc.SolrResourceLoader.<init> new SolrResourceLoader for directory: '../../../../../../../../../../mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build/solr-core/test/J0/./org.apache.solr.cloud.OverseerRolesTest-jetty3-1390074069201/testOverseerCol_shard3_replica1/'
[junit4] 2> 602560 T2189 oasc.SolrConfig.<init> Using Lucene MatchVersion: LUCENE_50
[junit4] 2> 602576 T2200 oasc.SolrConfig.<init> Using Lucene MatchVersion: LUCENE_50
[junit4] 2> 602578 T2215 oasc.SolrConfig.<init> Using Lucene MatchVersion: LUCENE_50
[junit4] 2> 602578 T2244 oasc.SolrConfig.<init> Using Lucene MatchVersion: LUCENE_50
[junit4] 2> 602587 T2245 oasc.SolrConfig.<init> Using Lucene MatchVersion: LUCENE_50
[junit4] 2> 602587 T2228 oasc.SolrConfig.<init> Using Lucene MatchVersion: LUCENE_50
[junit4] 2> 602588 T2168 oasc.SolrConfig.<init> Using Lucene MatchVersion: LUCENE_50
[junit4] 2> 602613 T2257 oasc.SolrConfig.<init> Using Lucene MatchVersion: LUCENE_50
[junit4] 2> 602636 T2189 oasc.SolrConfig.<init> Loaded SolrConfig: solrconfig.xml
[junit4] 2> 602638 T2189 oass.IndexSchema.readSchema Reading Solr Schema from schema.xml
[junit4] 2> 602649 T2189 oass.IndexSchema.readSchema [testOverseerCol_shard2_replica1] Schema name=test
[junit4] 2> 602658 T2215 oasc.SolrConfig.<init> Loaded SolrConfig: solrconfig.xml
[junit4] 2> 602660 T2215 oass.IndexSchema.readSchema Reading Solr Schema from schema.xml
[junit4] 2> 602663 T2244 oasc.SolrConfig.<init> Loaded SolrConfig: solrconfig.xml
[junit4] 2> 602664 T2245 oasc.SolrConfig.<init> Loaded SolrConfig: solrconfig.xml
[junit4] 2> 602665 T2244 oass.IndexSchema.readSchema Reading Solr Schema from schema.xml
[junit4] 2> 602666 T2245 oass.IndexSchema.readSchema Reading Solr Schema from schema.xml
[junit4] 2> 602675 T2215 oass.IndexSchema.readSchema [testOverseerCol_shard3_replica1] Schema name=test
[junit4] 2> 602675 T2244 oass.IndexSchema.readSchema [testOverseerCol_shard1_replica1] Schema name=test
[junit4] 2> 602675 T2245 oass.IndexSchema.readSchema [testOverseerCol_shard4_replica2] Schema name=test
[junit4] 2> 602679 T2200 oasc.SolrConfig.<init> Loaded SolrConfig: solrconfig.xml
[junit4] 2> 602681 T2200 oass.IndexSchema.readSchema Reading Solr Schema from schema.xml
[junit4] 2> 602688 T2228 oasc.SolrConfig.<init> Loaded SolrConfig: solrconfig.xml
[junit4] 2> 602689 T2228 oass.IndexSchema.readSchema Reading Solr Schema from schema.xml
[junit4] 2> 602690 T2168 oasc.SolrConfig.<init> Loaded SolrConfig: solrconfig.xml
[junit4] 2> 602699 T2168 oass.IndexSchema.readSchema Reading Solr Schema from schema.xml
[junit4] 2> 602700 T2228 oass.IndexSchema.readSchema [testOverseerCol_shard1_replica2] Schema name=test
[junit4] 2> 602713 T2200 oass.IndexSchema.readSchema [testOverseerCol_shard3_replica2] Schema name=test
[junit4] 2> 602717 T2168 oass.IndexSchema.readSchema [testOverseerCol_shard2_replica2] Schema name=test
[junit4] 2> 602733 T2257 oasc.SolrConfig.<init> Loaded SolrConfig: solrconfig.xml
[junit4] 2> 602738 T2257 oass.IndexSchema.readSchema Reading Solr Schema from schema.xml
[junit4] 2> 602746 T2257 oass.IndexSchema.readSchema [testOverseerCol_shard4_replica1] Schema name=test
[junit4] 2> 603882 T2215 oass.OpenExchangeRatesOrgProvider.init Initialized with rates=open-exchange-rates.json, refreshInterval=1440.
[junit4] 2> 603886 T2189 oass.OpenExchangeRatesOrgProvider.init Initialized with rates=open-exchange-rates.json, refreshInterval=1440.
[junit4] 2> 603891 T2215 oass.IndexSchema.readSchema default search field in schema is text
[junit4] 2> 603894 T2189 oass.IndexSchema.readSchema default search field in schema is text
[junit4] 2> 603897 T2215 oass.IndexSchema.readSchema unique key field: id
[junit4] 2> 603898 T2189 oass.IndexSchema.readSchema unique key field: id
[junit4] 2> 603912 T2244 oass.OpenExchangeRatesOrgProvider.init Initialized with rates=open-exchange-rates.json, refreshInterval=1440.
[junit4] 2> 603917 T2215 oass.FileExchangeRateProvider.reload Reloading exchange rates from file currency.xml
[junit4] 2> 603920 T2244 oass.IndexSchema.readSchema default search field in schema is text
[junit4] 2> 603927 T2215 oass.FileExchangeRateProvider.reload Reloading exchange rates from file currency.xml
[junit4] 2> 603931 T2244 oass.IndexSchema.readSchema unique key field: id
[junit4] 2> 603932 T2215 oass.OpenExchangeRatesOrgProvider.reload Reloading exchange rates from open-exchange-rates.json
[junit4] 2> 603933 T2189 oass.FileExchangeRateProvider.reload Reloading exchange rates from file currency.xml
[junit4] 2> 603933 T2215 oass.OpenExchangeRatesOrgProvider$OpenExchangeRates.<init> WARN Unknown key IMPORTANT NOTE
[junit4] 2> 603933 T2215 oass.OpenExchangeRatesOrgProvider$OpenExchangeRates.<init> WARN Expected key, got STRING
[junit4] 2> 603934 T2215 oass.OpenExchangeRatesOrgProvider.reload Reloading exchange rates from open-exchange-rates.json
[junit4] 2> 603935 T2215 oass.OpenExchangeRatesOrgProvider$OpenExchangeRates.<init> WARN Unknown key IMPORTANT NOTE
[junit4] 2> 603935 T2215 oass.OpenExchangeRatesOrgProvider$OpenExchangeRates.<init> WARN Expected key, got STRING
[junit4] 2> 603936 T2215 oasc.SolrCore.initDirectoryFactory org.apache.solr.core.MockDirectoryFactory
[junit4] 2> 603936 T2215 oasc.SolrCore.<init> [testOverseerCol_shard3_replica1] Opening new SolrCore at ../../../../../../../../../../mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build/solr-core/test/J0/./org.apache.solr.cloud.OverseerRolesTest-jetty3-1390074069201/testOverseerCol_shard3_replica1/, dataDir=../../../../../../../../../../mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build/solr-core/test/J0/./org.apache.solr.cloud.OverseerRolesTest-jetty3-1390074069201/testOverseerCol_shard3_replica1/data/
[junit4] 2> 603936 T2189 oass.FileExchangeRateProvider.reload Reloading exchange rates from file currency.xml
[junit4] 2> 603950 T2215 oasc.JmxMonitoredMap.<init> JMX monitoring is enabled. Adding Solr mbeans to JMX Server: com.sun.jmx.mbeanserver.JmxMBeanServer@535e6d
[junit4] 2> 603952 T2215 oasc.CachingDirectoryFactory.get return new directory for ../../../../../../../../../../mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build/solr-core/test/J0/./org.apache.solr.cloud.OverseerRolesTest-jetty3-1390074069201/testOverseerCol_shard3_replica1/data
[junit4] 2> 603953 T2215 oasc.SolrCore.getNewIndexDir New index directory detected: old=null new=../../../../../../../../../../mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build/solr-core/test/J0/./org.apache.solr.cloud.OverseerRolesTest-jetty3-1390074069201/testOverseerCol_shard3_replica1/data/index/
[junit4] 2> 603953 T2215 oasc.SolrCore.initIndex WARN [testOverseerCol_shard3_replica1] Solr index directory '../../../../../../../../../../mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build/solr-core/test/J0/./org.apache.solr.cloud.OverseerRolesTest-jetty3-1390074069201/testOverseerCol_shard3_replica1/data/index' doesn't exist. Creating new index...
[junit4] 2> 603954 T2215 oasc.CachingDirectoryFactory.get return new directory for ../../../../../../../../../../mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build/solr-core/test/J0/./org.apache.solr.cloud.OverseerRolesTest-jetty3-1390074069201/testOverseerCol_shard3_replica1/data/index
[junit4] 2> 603954 T2215 oasu.RandomMergePolicy.<init> RandomMergePolicy wrapping class org.apache.lucene.index.LogDocMergePolicy: [LogDocMergePolicy: minMergeSize=1000, mergeFactor=35, maxMergeSize=9223372036854775807, maxMergeSizeForForcedMerge=9223372036854775807, calibrateSizeByDeletes=false, maxMergeDocs=2147483647, maxCFSSegmentSizeMB=8.796093022207999E12, noCFSRatio=0.7499847515212315]
[junit4] 2> 603955 T2215 oasc.SolrDeletionPolicy.onCommit SolrDeletionPolicy.onCommit: commits: num=1
[junit4] 2> commit{dir=MockDirectoryWrapper(org.apache.lucene.store.RAMDirectory@1397428 lockFactory=org.apache.lucene.store.SingleInstanceLockFactory@1ef60dd),segFN=segments_1,generation=1}
[junit4] 2> 603956 T2215 oasc.SolrDeletionPolicy.updateCommits newest commit generation = 1
[junit4] 2> 603960 T2215 oasup.UpdateRequestProcessorChain.init creating updateRequestProcessorChain "nodistrib"
[junit4] 2> 603961 T2215 oasup.UpdateRequestProcessorChain.init creating updateRequestProcessorChain "dedupe"
[junit4] 2> 603961 T2215 oasup.UpdateRequestProcessorChain.init inserting DistributedUpdateProcessorFactory into updateRequestProcessorChain "dedupe"
[junit4] 2> 603961 T2215 oasup.UpdateRequestProcessorChain.init creating updateRequestProcessorChain "stored_sig"
[junit4] 2> 603962 T2215 oasup.UpdateRequestProcessorChain.init inserting DistributedUpdateProcessorFactory into updateRequestProcessorChain "stored_sig"
[junit4] 2> 603963 T2215 oasup.UpdateRequestProcessorChain.init creating updateRequestProcessorChain "distrib-dup-test-chain-explicit"
[junit4] 2> 603964 T2215 oasup.UpdateRequestProcessorChain.init creating updateRequestProcessorChain "distrib-dup-test-chain-implicit"
[junit4] 2> 603965 T2215 oasup.UpdateRequestProcessorChain.init inserting DistributedUpdateProcessorFactory into updateRequestProcessorChain "distrib-dup-test-chain-implicit"
[junit4] 2> 603965 T2215 oasc.SolrCore.loadUpdateProcessorChains no updateRequestProcessorChain defined as default, creating implicit default
[junit4] 2> 603966 T2189 oass.OpenExchangeRatesOrgProvider.reload Reloading exchange rates from open-exchange-rates.json
[junit4] 2> 603967 T2215 oasc.RequestHandlers.initHandlersFromConfig created standard: solr.StandardRequestHandler
[junit4] 2> 603968 T2189 oass.OpenExchangeRatesOrgProvider$OpenExchangeRates.<init> WARN Unknown key IMPORTANT NOTE
[junit4] 2> 603968 T2189 oass.OpenExchangeRatesOrgProvider$OpenExchangeRates.<init> WARN Expected key, got STRING
[junit4] 2> 603968 T2189 oass.OpenExchangeRatesOrgProvider.reload Reloading exchange rates from open-exchange-rates.json
[junit4] 2> 603968 T2215 oasc.RequestHandlers.initHandlersFromConfig created /get: solr.RealTimeGetHandler
[junit4] 2> 603971 T2244 oass.FileExchangeRateProvider.reload Reloading exchange rates from file currency.xml
[junit4] 2> 603970 T2189 oass.OpenExchangeRatesOrgProvider$OpenExchangeRates.<init> WARN Unknown key IMPORTANT NOTE
[junit4] 2> 603972 T2189 oass.OpenExchangeRatesOrgProvider$OpenExchangeRates.<init> WARN Expected key, got STRING
[junit4] 2> 603973 T2189 oasc.SolrCore.initDirectoryFactory org.apache.solr.core.MockDirectoryFactory
[junit4] 2> 603973 T2189 oasc.SolrCore.<init> [testOverseerCol_shard2_replica1] Opening new SolrCore at ./org.apache.solr.cloud.OverseerRolesTest-jetty1-1390074066884/testOverseerCol_shard2_replica1/, dataDir=./org.apache.solr.cloud.OverseerRolesTest-jetty1-1390074066884/testOverseerCol_shard2_replica1/data/
[junit4] 2> 603973 T2189 oasc.JmxMonitoredMap.<init> JMX monitoring is enabled. Adding Solr mbeans to JMX Server: com.sun.jmx.mbeanserver.JmxMBeanServer@535e6d
[junit4] 2> 603972 T2215 oasc.RequestHandlers.initHandlersFromConfig adding lazy requestHandler: solr.ReplicationHandler
[junit4] 2> 603977 T2215 oasc.RequestHandlers.initHandlersFromConfig created /replication: solr.ReplicationHandler
[junit4] 2> 603978 T2215 oasc.RequestHandlers.initHandlersFromConfig created /update: solr.UpdateRequestHandler
[junit4] 2> 603978 T2244 oass.FileExchangeRateProvider.reload Reloading exchange rates from file currency.xml
[junit4] 2> 603978 T2189 oasc.CachingDirectoryFactory.get return new directory for ./org.apache.solr.cloud.OverseerRolesTest-jetty1-1390074066884/testOverseerCol_shard2_replica1/data
[junit4] 2> 603978 T2215 oasc.RequestHandlers.initHandlersFromConfig created /admin/: org.apache.solr.handler.admin.AdminHandlers
[junit4] 2> 603980 T2215 oasc.RequestHandlers.initHandlersFromConfig created /admin/file: solr.admin.ShowFileRequestHandler
[junit4] 2> 603981 T2215 oasc.RequestHandlers.initHandlersFromConfig created /admi
[...truncated too long message...]
dexWriterCloser
[junit4] 2> 622372 T2263 oasc.SolrCore.closeSearcher [testOverseerCol_shard4_replica1] Closing main searcher on request.
[junit4] 2> 622373 T2263 oasc.CachingDirectoryFactory.close Closing MockDirectoryFactory - 2 directories currently being tracked
[junit4] 2> 622373 T2263 oasc.CachingDirectoryFactory.closeCacheValue looking to close ./org.apache.solr.cloud.OverseerRolesTest-jetty6-1390074072696/testOverseerCol_shard4_replica1/data [CachedDir<<refCount=0;path=./org.apache.solr.cloud.OverseerRolesTest-jetty6-1390074072696/testOverseerCol_shard4_replica1/data;done=false>>]
[junit4] 2> 622373 T2263 oasc.CachingDirectoryFactory.close Closing directory: ./org.apache.solr.cloud.OverseerRolesTest-jetty6-1390074072696/testOverseerCol_shard4_replica1/data
[junit4] 2> 622373 T2263 oasc.CachingDirectoryFactory.closeCacheValue looking to close ./org.apache.solr.cloud.OverseerRolesTest-jetty6-1390074072696/testOverseerCol_shard4_replica1/data/index [CachedDir<<refCount=0;path=./org.apache.solr.cloud.OverseerRolesTest-jetty6-1390074072696/testOverseerCol_shard4_replica1/data/index;done=false>>]
[junit4] 2> 622373 T2263 oasc.CachingDirectoryFactory.close Closing directory: ./org.apache.solr.cloud.OverseerRolesTest-jetty6-1390074072696/testOverseerCol_shard4_replica1/data/index
[junit4] 2> 622373 T2263 oascc.SolrZkClient.makePath makePath: /collections/testOverseerCol/leaders/shard4
[junit4] 2> 622374 T2263 oasc.SolrException.log ERROR There was a problem trying to register as the leader:org.apache.zookeeper.KeeperException$SessionExpiredException: KeeperErrorCode = Session expired for /collections
[junit4] 2> at org.apache.zookeeper.KeeperException.create(KeeperException.java:127)
[junit4] 2> at org.apache.zookeeper.KeeperException.create(KeeperException.java:51)
[junit4] 2> at org.apache.zookeeper.ZooKeeper.exists(ZooKeeper.java:1041)
[junit4] 2> at org.apache.solr.common.cloud.SolrZkClient$3.execute(SolrZkClient.java:205)
[junit4] 2> at org.apache.solr.common.cloud.SolrZkClient$3.execute(SolrZkClient.java:202)
[junit4] 2> at org.apache.solr.common.cloud.ZkCmdExecutor.retryOperation(ZkCmdExecutor.java:73)
[junit4] 2> at org.apache.solr.common.cloud.SolrZkClient.exists(SolrZkClient.java:202)
[junit4] 2> at org.apache.solr.common.cloud.SolrZkClient.makePath(SolrZkClient.java:413)
[junit4] 2> at org.apache.solr.common.cloud.SolrZkClient.makePath(SolrZkClient.java:382)
[junit4] 2> at org.apache.solr.common.cloud.SolrZkClient.makePath(SolrZkClient.java:369)
[junit4] 2> at org.apache.solr.cloud.ShardLeaderElectionContextBase.runLeaderProcess(ElectionContext.java:112)
[junit4] 2> at org.apache.solr.cloud.ShardLeaderElectionContext.runLeaderProcess(ElectionContext.java:273)
[junit4] 2> at org.apache.solr.cloud.LeaderElector.runIamLeaderProcess(LeaderElector.java:164)
[junit4] 2> at org.apache.solr.cloud.LeaderElector.checkIfIamLeader(LeaderElector.java:108)
[junit4] 2> at org.apache.solr.cloud.LeaderElector.access$000(LeaderElector.java:55)
[junit4] 2> at org.apache.solr.cloud.LeaderElector$1.process(LeaderElector.java:137)
[junit4] 2> at org.apache.zookeeper.ClientCnxn$EventThread.processEvent(ClientCnxn.java:519)
[junit4] 2> at org.apache.zookeeper.ClientCnxn$EventThread.run(ClientCnxn.java:495)
[junit4] 2>
[junit4] 2> 622374 T2263 oasc.LeaderElector$1.process WARN org.apache.zookeeper.KeeperException$SessionExpiredException: KeeperErrorCode = Session expired for /collections/testOverseerCol/leader_elect/shard4/election/91099894024765456-core_node3-n_0000000001
[junit4] 2> at org.apache.zookeeper.KeeperException.create(KeeperException.java:127)
[junit4] 2> at org.apache.zookeeper.KeeperException.create(KeeperException.java:51)
[junit4] 2> at org.apache.zookeeper.ZooKeeper.delete(ZooKeeper.java:873)
[junit4] 2> at org.apache.solr.common.cloud.SolrZkClient$2.execute(SolrZkClient.java:173)
[junit4] 2> at org.apache.solr.common.cloud.SolrZkClient$2.execute(SolrZkClient.java:170)
[junit4] 2> at org.apache.solr.common.cloud.ZkCmdExecutor.retryOperation(ZkCmdExecutor.java:73)
[junit4] 2> at org.apache.solr.common.cloud.SolrZkClient.delete(SolrZkClient.java:170)
[junit4] 2> at org.apache.solr.cloud.ElectionContext.cancelElection(ElectionContext.java:67)
[junit4] 2> at org.apache.solr.cloud.ShardLeaderElectionContext.runLeaderProcess(ElectionContext.java:293)
[junit4] 2> at org.apache.solr.cloud.LeaderElector.runIamLeaderProcess(LeaderElector.java:164)
[junit4] 2> at org.apache.solr.cloud.LeaderElector.checkIfIamLeader(LeaderElector.java:108)
[junit4] 2> at org.apache.solr.cloud.LeaderElector.access$000(LeaderElector.java:55)
[junit4] 2> at org.apache.solr.cloud.LeaderElector$1.process(LeaderElector.java:137)
[junit4] 2> at org.apache.zookeeper.ClientCnxn$EventThread.processEvent(ClientCnxn.java:519)
[junit4] 2> at org.apache.zookeeper.ClientCnxn$EventThread.run(ClientCnxn.java:495)
[junit4] 2>
[junit4] 2> 622374 T2263 oascc.ZkStateReader$3.process WARN ZooKeeper watch triggered, but Solr cannot talk to ZK
[junit4] 2> 622375 T2263 oascc.ZkStateReader$2.process A cluster state change: WatchedEvent state:SyncConnected type:NodeDataChanged path:/clusterstate.json, has occurred - updating... (live nodes size: 1)
[junit4] 2> 622375 T2263 oascc.ZkStateReader$2.process WARN ZooKeeper watch triggered, but Solr cannot talk to ZK
[junit4] 2> 622375 T2263 oasc.DistributedQueue$LatchChildWatcher.process LatchChildWatcher fired on path: /overseer/queue state: SyncConnected type NodeChildrenChanged
[junit4] 2> 622375 T2263 oasc.DistributedQueue$LatchChildWatcher.process LatchChildWatcher fired on path: /overseer/queue state: SyncConnected type NodeChildrenChanged
[junit4] 2> 622375 T2263 oasc.DistributedQueue$LatchChildWatcher.process LatchChildWatcher fired on path: /overseer/queue state: SyncConnected type NodeChildrenChanged
[junit4] 2> 622375 T2263 oasc.DistributedQueue$LatchChildWatcher.process LatchChildWatcher fired on path: /overseer/queue state: SyncConnected type NodeChildrenChanged
[junit4] 2> 622375 T2263 oasc.DistributedQueue$LatchChildWatcher.process LatchChildWatcher fired on path: /overseer/queue state: SyncConnected type NodeChildrenChanged
[junit4] 2> 622375 T2263 oasc.DistributedQueue$LatchChildWatcher.process LatchChildWatcher fired on path: /overseer/queue state: SyncConnected type NodeChildrenChanged
[junit4] 2> 622376 T2263 oasc.DistributedQueue$LatchChildWatcher.process LatchChildWatcher fired on path: /overseer/queue state: SyncConnected type NodeChildrenChanged
[junit4] 2> NOTE: test params are: codec=Asserting, sim=DefaultSimilarity, locale=de_AT, timezone=US/Hawaii
[junit4] 2> NOTE: Linux 3.8.0-35-generic i386/Oracle Corporation 1.7.0_51 (32-bit)/cpus=8,threads=1,free=124184976,total=311689216
[junit4] 2> NOTE: All tests run in this JVM: [TestElisionMultitermQuery, AnalysisAfterCoreReloadTest, ShardRoutingTest, MBeansHandlerTest, SolrInfoMBeanTest, DistribCursorPagingTest, DOMUtilTest, TestValueSourceCache, CacheHeaderTest, TestSolrIndexConfig, TestCollapseQParserPlugin, TestExtendedDismaxParser, TestLMDirichletSimilarityFactory, BasicFunctionalityTest, OverseerTest, TestJoin, SolrXmlInZkTest, TestPostingsSolrHighlighter, ExternalFileFieldSortTest, SuggestComponentTest, TestNonNRTOpen, ScriptEngineTest, TestLFUCache, URLClassifyProcessorTest, TestSimpleQParserPlugin, TestCoreContainer, TestCustomSort, ResourceLoaderTest, ZkCLITest, TestQueryUtils, OverseerCollectionProcessorTest, JsonLoaderTest, ClusterStateUpdateTest, TestDocumentBuilder, HdfsDirectoryTest, TestCloudManagedSchemaAddField, TestModifyConfFiles, ExpressionTest, TestWriterPerf, MoreLikeThisHandlerTest, TestShardHandlerFactory, SliceStateUpdateTest, FieldMutatingUpdateProcessorTest, TestPerFieldSimilarity, RegexBoostProcessorTest, TestStressVersions, RangeFacetTest, TestCollationFieldDocValues, BadComponentTest, TermVectorComponentTest, SliceStateTest, TestManagedSchema, DocValuesTest, TestLMJelinekMercerSimilarityFactory, SolrIndexSplitterTest, UpdateRequestProcessorFactoryTest, SuggesterTest, UpdateParamsTest, CopyFieldTest, SyncSliceTest, TestBM25SimilarityFactory, CircularListTest, HdfsBasicDistributedZk2Test, SearchHandlerTest, SampleTest, DistributedQueryElevationComponentTest, OverseerRolesTest]
[junit4] Completed on J0 in 28.40s, 1 test, 1 failure <<< FAILURES!
[...truncated 628 lines...]
BUILD FAILED
/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/build.xml:453: The following error occurred while executing this line:
/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/build.xml:433: The following error occurred while executing this line:
/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/build.xml:39: The following error occurred while executing this line:
/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/extra-targets.xml:37: The following error occurred while executing this line:
/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build.xml:189: The following error occurred while executing this line:
/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/common-build.xml:491: The following error occurred while executing this line:
/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/lucene/common-build.xml:1304: The following error occurred while executing this line:
/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/lucene/common-build.xml:937: There were test failures: 364 suites, 1596 tests, 1 failure, 34 ignored (6 assumptions)
Total time: 43 minutes 25 seconds
Build step 'Invoke Ant' marked build as failure
Description set: Java: 32bit/jdk1.7.0_51 -server -XX:+UseParallelGC
Archiving artifacts
Recording test results
Email was triggered for: Failure
Sending email for trigger: Failure
[JENKINS] Lucene-Solr-trunk-Linux (64bit/jdk1.7.0_60-ea-b02) -
Build # 9145 - Still Failing!
Posted by Policeman Jenkins Server <je...@thetaphi.de>.
Build: http://jenkins.thetaphi.de/job/Lucene-Solr-trunk-Linux/9145/
Java: 64bit/jdk1.7.0_60-ea-b02 -XX:-UseCompressedOops -XX:+UseParallelGC
7 tests failed.
REGRESSION: org.apache.solr.analytics.expression.ExpressionTest.negateTest
Error Message:
Caught exception in getStatResult, xPath = /response/lst[@name='stats']/lst[@name='nr']/double[@name='sum'] raw data: <?xml version="1.0" encoding="UTF-8"?> <response> <lst name="responseHeader"> <int name="status">0</int> <int name="QTime">120</int> </lst> <result name="response" numFound="100" start="0"> </result> <lst name="stats"> <lst name="stats_fields"/> </lst> <lst name="stats"> <lst name="ar"> <long name="count">100</long> <null name="mcm"/> <null name="mean"/> <null name="median"/> <null name="su"/> <null name="sum"/> <null name="unique"/> </lst> <lst name="rr"> <str name="max">str9</str> <str name="min">str0</str> <str name="rmax">9rts</str> <str name="rmin">0rts</str> </lst> <lst name="dmr"> <str name="cma">+2MONTHS</str> <str name="cme">+2YEARS</str> <date name="dmma">1812-02-29T23:59:59Z</date> <date name="dmme">1807-12-31T23:59:59Z</date> <date name="max">1811-12-31T23:59:59Z</date> <date name="median">1805-12-31T23:59:59Z</date> </lst> <lst name="dr"> <long name="count">100</long> <null name="mc"/> <null name="mean"/> <null name="su"/> <null name="sum"/> <null name="unique"/> </lst> <lst name="avr"> <double name="c">100.0</double> <long name="count">100</long> <null name="s"/> <null name="sum"/> </lst> <lst name="cr"> <str name="ccmax">this is the secondstr9</str> <str name="ccmin">this is the firststr0</str> <str name="csmax">this is the second</str> <str name="csmin">this is the first</str> <str name="max">str9</str> <str name="min">str0</str> </lst> <lst name="mr"> <long name="count">100</long> <null name="mcm"/> <null name="mean"/> <null name="median"/> <null name="su"/> <null name="sum"/> <null name="unique"/> </lst> <lst name="cdr"> <date name="cd1">1800-12-31T23:59:59Z</date> <date name="cd2">1804-06-30T23:59:59Z</date> <str name="cs1">1800-12-31T23:59:59Z</str> <str name="cs2">1804-06-30T23:59:59Z</str> </lst> <lst name="pr"> <long name="count">100</long> <null name="mc"/> <null name="mean"/> <null name="su"/> <null name="sum"/> <null name="unique"/> </lst> <lst name="csr"> <str name="cs1">this is the first</str> <str name="cs2">this is the second</str> <str name="cs3">this is the third</str> </lst> <lst name="nr"> <double name="c">-100.0</double> <long name="count">100</long> <null name="s"/> <null name="sum"/> </lst> <lst name="cnr"> <double name="c10">10.0</double> <double name="c8">8.0</double> </lst> </lst> </response>
Stack Trace:
java.lang.AssertionError: Caught exception in getStatResult, xPath = /response/lst[@name='stats']/lst[@name='nr']/double[@name='sum']
raw data: <?xml version="1.0" encoding="UTF-8"?>
<response>
<lst name="responseHeader">
<int name="status">0</int>
<int name="QTime">120</int>
</lst>
<result name="response" numFound="100" start="0">
</result>
<lst name="stats">
<lst name="stats_fields"/>
</lst>
<lst name="stats">
<lst name="ar">
<long name="count">100</long>
<null name="mcm"/>
<null name="mean"/>
<null name="median"/>
<null name="su"/>
<null name="sum"/>
<null name="unique"/>
</lst>
<lst name="rr">
<str name="max">str9</str>
<str name="min">str0</str>
<str name="rmax">9rts</str>
<str name="rmin">0rts</str>
</lst>
<lst name="dmr">
<str name="cma">+2MONTHS</str>
<str name="cme">+2YEARS</str>
<date name="dmma">1812-02-29T23:59:59Z</date>
<date name="dmme">1807-12-31T23:59:59Z</date>
<date name="max">1811-12-31T23:59:59Z</date>
<date name="median">1805-12-31T23:59:59Z</date>
</lst>
<lst name="dr">
<long name="count">100</long>
<null name="mc"/>
<null name="mean"/>
<null name="su"/>
<null name="sum"/>
<null name="unique"/>
</lst>
<lst name="avr">
<double name="c">100.0</double>
<long name="count">100</long>
<null name="s"/>
<null name="sum"/>
</lst>
<lst name="cr">
<str name="ccmax">this is the secondstr9</str>
<str name="ccmin">this is the firststr0</str>
<str name="csmax">this is the second</str>
<str name="csmin">this is the first</str>
<str name="max">str9</str>
<str name="min">str0</str>
</lst>
<lst name="mr">
<long name="count">100</long>
<null name="mcm"/>
<null name="mean"/>
<null name="median"/>
<null name="su"/>
<null name="sum"/>
<null name="unique"/>
</lst>
<lst name="cdr">
<date name="cd1">1800-12-31T23:59:59Z</date>
<date name="cd2">1804-06-30T23:59:59Z</date>
<str name="cs1">1800-12-31T23:59:59Z</str>
<str name="cs2">1804-06-30T23:59:59Z</str>
</lst>
<lst name="pr">
<long name="count">100</long>
<null name="mc"/>
<null name="mean"/>
<null name="su"/>
<null name="sum"/>
<null name="unique"/>
</lst>
<lst name="csr">
<str name="cs1">this is the first</str>
<str name="cs2">this is the second</str>
<str name="cs3">this is the third</str>
</lst>
<lst name="nr">
<double name="c">-100.0</double>
<long name="count">100</long>
<null name="s"/>
<null name="sum"/>
</lst>
<lst name="cnr">
<double name="c10">10.0</double>
<double name="c8">8.0</double>
</lst>
</lst>
</response>
at __randomizedtesting.SeedInfo.seed([646717EF9CB6285C:6C6F7F4A389B78EC]:0)
at org.junit.Assert.fail(Assert.java:93)
at org.apache.solr.analytics.AbstractAnalyticsStatsTest.getStatResult(AbstractAnalyticsStatsTest.java:113)
at org.apache.solr.analytics.expression.ExpressionTest.negateTest(ExpressionTest.java:132)
at sun.reflect.NativeMethodAccessorImpl.invoke0(Native Method)
at sun.reflect.NativeMethodAccessorImpl.invoke(NativeMethodAccessorImpl.java:57)
at sun.reflect.DelegatingMethodAccessorImpl.invoke(DelegatingMethodAccessorImpl.java:43)
at java.lang.reflect.Method.invoke(Method.java:606)
at com.carrotsearch.randomizedtesting.RandomizedRunner.invoke(RandomizedRunner.java:1559)
at com.carrotsearch.randomizedtesting.RandomizedRunner.access$600(RandomizedRunner.java:79)
at com.carrotsearch.randomizedtesting.RandomizedRunner$6.evaluate(RandomizedRunner.java:737)
at com.carrotsearch.randomizedtesting.RandomizedRunner$7.evaluate(RandomizedRunner.java:773)
at com.carrotsearch.randomizedtesting.RandomizedRunner$8.evaluate(RandomizedRunner.java:787)
at com.carrotsearch.randomizedtesting.rules.SystemPropertiesRestoreRule$1.evaluate(SystemPropertiesRestoreRule.java:53)
at org.apache.lucene.util.TestRuleSetupTeardownChained$1.evaluate(TestRuleSetupTeardownChained.java:50)
at org.apache.lucene.util.TestRuleFieldCacheSanity$1.evaluate(TestRuleFieldCacheSanity.java:51)
at org.apache.lucene.util.AbstractBeforeAfterRule$1.evaluate(AbstractBeforeAfterRule.java:46)
at com.carrotsearch.randomizedtesting.rules.SystemPropertiesInvariantRule$1.evaluate(SystemPropertiesInvariantRule.java:55)
at org.apache.lucene.util.TestRuleThreadAndTestName$1.evaluate(TestRuleThreadAndTestName.java:49)
at org.apache.lucene.util.TestRuleIgnoreAfterMaxFailures$1.evaluate(TestRuleIgnoreAfterMaxFailures.java:70)
at org.apache.lucene.util.TestRuleMarkFailure$1.evaluate(TestRuleMarkFailure.java:48)
at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
at com.carrotsearch.randomizedtesting.ThreadLeakControl$StatementRunner.run(ThreadLeakControl.java:358)
at com.carrotsearch.randomizedtesting.ThreadLeakControl.forkTimeoutingTask(ThreadLeakControl.java:782)
at com.carrotsearch.randomizedtesting.ThreadLeakControl$3.evaluate(ThreadLeakControl.java:442)
at com.carrotsearch.randomizedtesting.RandomizedRunner.runSingleTest(RandomizedRunner.java:746)
at com.carrotsearch.randomizedtesting.RandomizedRunner$3.evaluate(RandomizedRunner.java:648)
at com.carrotsearch.randomizedtesting.RandomizedRunner$4.evaluate(RandomizedRunner.java:682)
at com.carrotsearch.randomizedtesting.RandomizedRunner$5.evaluate(RandomizedRunner.java:693)
at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
at com.carrotsearch.randomizedtesting.rules.SystemPropertiesRestoreRule$1.evaluate(SystemPropertiesRestoreRule.java:53)
at org.apache.lucene.util.AbstractBeforeAfterRule$1.evaluate(AbstractBeforeAfterRule.java:46)
at org.apache.lucene.util.TestRuleStoreClassName$1.evaluate(TestRuleStoreClassName.java:42)
at com.carrotsearch.randomizedtesting.rules.SystemPropertiesInvariantRule$1.evaluate(SystemPropertiesInvariantRule.java:55)
at com.carrotsearch.randomizedtesting.rules.NoShadowingOrOverridesOnMethodsRule$1.evaluate(NoShadowingOrOverridesOnMethodsRule.java:39)
at com.carrotsearch.randomizedtesting.rules.NoShadowingOrOverridesOnMethodsRule$1.evaluate(NoShadowingOrOverridesOnMethodsRule.java:39)
at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
at org.apache.lucene.util.TestRuleAssertionsRequired$1.evaluate(TestRuleAssertionsRequired.java:43)
at org.apache.lucene.util.TestRuleMarkFailure$1.evaluate(TestRuleMarkFailure.java:48)
at org.apache.lucene.util.TestRuleIgnoreAfterMaxFailures$1.evaluate(TestRuleIgnoreAfterMaxFailures.java:70)
at org.apache.lucene.util.TestRuleIgnoreTestSuites$1.evaluate(TestRuleIgnoreTestSuites.java:55)
at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
at com.carrotsearch.randomizedtesting.ThreadLeakControl$StatementRunner.run(ThreadLeakControl.java:358)
at java.lang.Thread.run(Thread.java:744)
REGRESSION: org.apache.solr.analytics.expression.ExpressionTest.absoluteValueTest
Error Message:
Caught exception in getStatResult, xPath = /response/lst[@name='stats']/lst[@name='avr']/double[@name='sum'] raw data: <?xml version="1.0" encoding="UTF-8"?> <response> <lst name="responseHeader"> <int name="status">0</int> <int name="QTime">120</int> </lst> <result name="response" numFound="100" start="0"> </result> <lst name="stats"> <lst name="stats_fields"/> </lst> <lst name="stats"> <lst name="ar"> <long name="count">100</long> <null name="mcm"/> <null name="mean"/> <null name="median"/> <null name="su"/> <null name="sum"/> <null name="unique"/> </lst> <lst name="rr"> <str name="max">str9</str> <str name="min">str0</str> <str name="rmax">9rts</str> <str name="rmin">0rts</str> </lst> <lst name="dmr"> <str name="cma">+2MONTHS</str> <str name="cme">+2YEARS</str> <date name="dmma">1812-02-29T23:59:59Z</date> <date name="dmme">1807-12-31T23:59:59Z</date> <date name="max">1811-12-31T23:59:59Z</date> <date name="median">1805-12-31T23:59:59Z</date> </lst> <lst name="dr"> <long name="count">100</long> <null name="mc"/> <null name="mean"/> <null name="su"/> <null name="sum"/> <null name="unique"/> </lst> <lst name="avr"> <double name="c">100.0</double> <long name="count">100</long> <null name="s"/> <null name="sum"/> </lst> <lst name="cr"> <str name="ccmax">this is the secondstr9</str> <str name="ccmin">this is the firststr0</str> <str name="csmax">this is the second</str> <str name="csmin">this is the first</str> <str name="max">str9</str> <str name="min">str0</str> </lst> <lst name="mr"> <long name="count">100</long> <null name="mcm"/> <null name="mean"/> <null name="median"/> <null name="su"/> <null name="sum"/> <null name="unique"/> </lst> <lst name="cdr"> <date name="cd1">1800-12-31T23:59:59Z</date> <date name="cd2">1804-06-30T23:59:59Z</date> <str name="cs1">1800-12-31T23:59:59Z</str> <str name="cs2">1804-06-30T23:59:59Z</str> </lst> <lst name="pr"> <long name="count">100</long> <null name="mc"/> <null name="mean"/> <null name="su"/> <null name="sum"/> <null name="unique"/> </lst> <lst name="csr"> <str name="cs1">this is the first</str> <str name="cs2">this is the second</str> <str name="cs3">this is the third</str> </lst> <lst name="nr"> <double name="c">-100.0</double> <long name="count">100</long> <null name="s"/> <null name="sum"/> </lst> <lst name="cnr"> <double name="c10">10.0</double> <double name="c8">8.0</double> </lst> </lst> </response>
Stack Trace:
java.lang.AssertionError: Caught exception in getStatResult, xPath = /response/lst[@name='stats']/lst[@name='avr']/double[@name='sum']
raw data: <?xml version="1.0" encoding="UTF-8"?>
<response>
<lst name="responseHeader">
<int name="status">0</int>
<int name="QTime">120</int>
</lst>
<result name="response" numFound="100" start="0">
</result>
<lst name="stats">
<lst name="stats_fields"/>
</lst>
<lst name="stats">
<lst name="ar">
<long name="count">100</long>
<null name="mcm"/>
<null name="mean"/>
<null name="median"/>
<null name="su"/>
<null name="sum"/>
<null name="unique"/>
</lst>
<lst name="rr">
<str name="max">str9</str>
<str name="min">str0</str>
<str name="rmax">9rts</str>
<str name="rmin">0rts</str>
</lst>
<lst name="dmr">
<str name="cma">+2MONTHS</str>
<str name="cme">+2YEARS</str>
<date name="dmma">1812-02-29T23:59:59Z</date>
<date name="dmme">1807-12-31T23:59:59Z</date>
<date name="max">1811-12-31T23:59:59Z</date>
<date name="median">1805-12-31T23:59:59Z</date>
</lst>
<lst name="dr">
<long name="count">100</long>
<null name="mc"/>
<null name="mean"/>
<null name="su"/>
<null name="sum"/>
<null name="unique"/>
</lst>
<lst name="avr">
<double name="c">100.0</double>
<long name="count">100</long>
<null name="s"/>
<null name="sum"/>
</lst>
<lst name="cr">
<str name="ccmax">this is the secondstr9</str>
<str name="ccmin">this is the firststr0</str>
<str name="csmax">this is the second</str>
<str name="csmin">this is the first</str>
<str name="max">str9</str>
<str name="min">str0</str>
</lst>
<lst name="mr">
<long name="count">100</long>
<null name="mcm"/>
<null name="mean"/>
<null name="median"/>
<null name="su"/>
<null name="sum"/>
<null name="unique"/>
</lst>
<lst name="cdr">
<date name="cd1">1800-12-31T23:59:59Z</date>
<date name="cd2">1804-06-30T23:59:59Z</date>
<str name="cs1">1800-12-31T23:59:59Z</str>
<str name="cs2">1804-06-30T23:59:59Z</str>
</lst>
<lst name="pr">
<long name="count">100</long>
<null name="mc"/>
<null name="mean"/>
<null name="su"/>
<null name="sum"/>
<null name="unique"/>
</lst>
<lst name="csr">
<str name="cs1">this is the first</str>
<str name="cs2">this is the second</str>
<str name="cs3">this is the third</str>
</lst>
<lst name="nr">
<double name="c">-100.0</double>
<long name="count">100</long>
<null name="s"/>
<null name="sum"/>
</lst>
<lst name="cnr">
<double name="c10">10.0</double>
<double name="c8">8.0</double>
</lst>
</lst>
</response>
at __randomizedtesting.SeedInfo.seed([646717EF9CB6285C:45CB37FA512B703A]:0)
at org.junit.Assert.fail(Assert.java:93)
at org.apache.solr.analytics.AbstractAnalyticsStatsTest.getStatResult(AbstractAnalyticsStatsTest.java:113)
at org.apache.solr.analytics.expression.ExpressionTest.absoluteValueTest(ExpressionTest.java:143)
at sun.reflect.NativeMethodAccessorImpl.invoke0(Native Method)
at sun.reflect.NativeMethodAccessorImpl.invoke(NativeMethodAccessorImpl.java:57)
at sun.reflect.DelegatingMethodAccessorImpl.invoke(DelegatingMethodAccessorImpl.java:43)
at java.lang.reflect.Method.invoke(Method.java:606)
at com.carrotsearch.randomizedtesting.RandomizedRunner.invoke(RandomizedRunner.java:1559)
at com.carrotsearch.randomizedtesting.RandomizedRunner.access$600(RandomizedRunner.java:79)
at com.carrotsearch.randomizedtesting.RandomizedRunner$6.evaluate(RandomizedRunner.java:737)
at com.carrotsearch.randomizedtesting.RandomizedRunner$7.evaluate(RandomizedRunner.java:773)
at com.carrotsearch.randomizedtesting.RandomizedRunner$8.evaluate(RandomizedRunner.java:787)
at com.carrotsearch.randomizedtesting.rules.SystemPropertiesRestoreRule$1.evaluate(SystemPropertiesRestoreRule.java:53)
at org.apache.lucene.util.TestRuleSetupTeardownChained$1.evaluate(TestRuleSetupTeardownChained.java:50)
at org.apache.lucene.util.TestRuleFieldCacheSanity$1.evaluate(TestRuleFieldCacheSanity.java:51)
at org.apache.lucene.util.AbstractBeforeAfterRule$1.evaluate(AbstractBeforeAfterRule.java:46)
at com.carrotsearch.randomizedtesting.rules.SystemPropertiesInvariantRule$1.evaluate(SystemPropertiesInvariantRule.java:55)
at org.apache.lucene.util.TestRuleThreadAndTestName$1.evaluate(TestRuleThreadAndTestName.java:49)
at org.apache.lucene.util.TestRuleIgnoreAfterMaxFailures$1.evaluate(TestRuleIgnoreAfterMaxFailures.java:70)
at org.apache.lucene.util.TestRuleMarkFailure$1.evaluate(TestRuleMarkFailure.java:48)
at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
at com.carrotsearch.randomizedtesting.ThreadLeakControl$StatementRunner.run(ThreadLeakControl.java:358)
at com.carrotsearch.randomizedtesting.ThreadLeakControl.forkTimeoutingTask(ThreadLeakControl.java:782)
at com.carrotsearch.randomizedtesting.ThreadLeakControl$3.evaluate(ThreadLeakControl.java:442)
at com.carrotsearch.randomizedtesting.RandomizedRunner.runSingleTest(RandomizedRunner.java:746)
at com.carrotsearch.randomizedtesting.RandomizedRunner$3.evaluate(RandomizedRunner.java:648)
at com.carrotsearch.randomizedtesting.RandomizedRunner$4.evaluate(RandomizedRunner.java:682)
at com.carrotsearch.randomizedtesting.RandomizedRunner$5.evaluate(RandomizedRunner.java:693)
at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
at com.carrotsearch.randomizedtesting.rules.SystemPropertiesRestoreRule$1.evaluate(SystemPropertiesRestoreRule.java:53)
at org.apache.lucene.util.AbstractBeforeAfterRule$1.evaluate(AbstractBeforeAfterRule.java:46)
at org.apache.lucene.util.TestRuleStoreClassName$1.evaluate(TestRuleStoreClassName.java:42)
at com.carrotsearch.randomizedtesting.rules.SystemPropertiesInvariantRule$1.evaluate(SystemPropertiesInvariantRule.java:55)
at com.carrotsearch.randomizedtesting.rules.NoShadowingOrOverridesOnMethodsRule$1.evaluate(NoShadowingOrOverridesOnMethodsRule.java:39)
at com.carrotsearch.randomizedtesting.rules.NoShadowingOrOverridesOnMethodsRule$1.evaluate(NoShadowingOrOverridesOnMethodsRule.java:39)
at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
at org.apache.lucene.util.TestRuleAssertionsRequired$1.evaluate(TestRuleAssertionsRequired.java:43)
at org.apache.lucene.util.TestRuleMarkFailure$1.evaluate(TestRuleMarkFailure.java:48)
at org.apache.lucene.util.TestRuleIgnoreAfterMaxFailures$1.evaluate(TestRuleIgnoreAfterMaxFailures.java:70)
at org.apache.lucene.util.TestRuleIgnoreTestSuites$1.evaluate(TestRuleIgnoreTestSuites.java:55)
at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
at com.carrotsearch.randomizedtesting.ThreadLeakControl$StatementRunner.run(ThreadLeakControl.java:358)
at java.lang.Thread.run(Thread.java:744)
REGRESSION: org.apache.solr.analytics.expression.ExpressionTest.addTest
Error Message:
Caught exception in getStatResult, xPath = /response/lst[@name='stats']/lst[@name='ar']/double[@name='sum'] raw data: <?xml version="1.0" encoding="UTF-8"?> <response> <lst name="responseHeader"> <int name="status">0</int> <int name="QTime">120</int> </lst> <result name="response" numFound="100" start="0"> </result> <lst name="stats"> <lst name="stats_fields"/> </lst> <lst name="stats"> <lst name="ar"> <long name="count">100</long> <null name="mcm"/> <null name="mean"/> <null name="median"/> <null name="su"/> <null name="sum"/> <null name="unique"/> </lst> <lst name="rr"> <str name="max">str9</str> <str name="min">str0</str> <str name="rmax">9rts</str> <str name="rmin">0rts</str> </lst> <lst name="dmr"> <str name="cma">+2MONTHS</str> <str name="cme">+2YEARS</str> <date name="dmma">1812-02-29T23:59:59Z</date> <date name="dmme">1807-12-31T23:59:59Z</date> <date name="max">1811-12-31T23:59:59Z</date> <date name="median">1805-12-31T23:59:59Z</date> </lst> <lst name="dr"> <long name="count">100</long> <null name="mc"/> <null name="mean"/> <null name="su"/> <null name="sum"/> <null name="unique"/> </lst> <lst name="avr"> <double name="c">100.0</double> <long name="count">100</long> <null name="s"/> <null name="sum"/> </lst> <lst name="cr"> <str name="ccmax">this is the secondstr9</str> <str name="ccmin">this is the firststr0</str> <str name="csmax">this is the second</str> <str name="csmin">this is the first</str> <str name="max">str9</str> <str name="min">str0</str> </lst> <lst name="mr"> <long name="count">100</long> <null name="mcm"/> <null name="mean"/> <null name="median"/> <null name="su"/> <null name="sum"/> <null name="unique"/> </lst> <lst name="cdr"> <date name="cd1">1800-12-31T23:59:59Z</date> <date name="cd2">1804-06-30T23:59:59Z</date> <str name="cs1">1800-12-31T23:59:59Z</str> <str name="cs2">1804-06-30T23:59:59Z</str> </lst> <lst name="pr"> <long name="count">100</long> <null name="mc"/> <null name="mean"/> <null name="su"/> <null name="sum"/> <null name="unique"/> </lst> <lst name="csr"> <str name="cs1">this is the first</str> <str name="cs2">this is the second</str> <str name="cs3">this is the third</str> </lst> <lst name="nr"> <double name="c">-100.0</double> <long name="count">100</long> <null name="s"/> <null name="sum"/> </lst> <lst name="cnr"> <double name="c10">10.0</double> <double name="c8">8.0</double> </lst> </lst> </response>
Stack Trace:
java.lang.AssertionError: Caught exception in getStatResult, xPath = /response/lst[@name='stats']/lst[@name='ar']/double[@name='sum']
raw data: <?xml version="1.0" encoding="UTF-8"?>
<response>
<lst name="responseHeader">
<int name="status">0</int>
<int name="QTime">120</int>
</lst>
<result name="response" numFound="100" start="0">
</result>
<lst name="stats">
<lst name="stats_fields"/>
</lst>
<lst name="stats">
<lst name="ar">
<long name="count">100</long>
<null name="mcm"/>
<null name="mean"/>
<null name="median"/>
<null name="su"/>
<null name="sum"/>
<null name="unique"/>
</lst>
<lst name="rr">
<str name="max">str9</str>
<str name="min">str0</str>
<str name="rmax">9rts</str>
<str name="rmin">0rts</str>
</lst>
<lst name="dmr">
<str name="cma">+2MONTHS</str>
<str name="cme">+2YEARS</str>
<date name="dmma">1812-02-29T23:59:59Z</date>
<date name="dmme">1807-12-31T23:59:59Z</date>
<date name="max">1811-12-31T23:59:59Z</date>
<date name="median">1805-12-31T23:59:59Z</date>
</lst>
<lst name="dr">
<long name="count">100</long>
<null name="mc"/>
<null name="mean"/>
<null name="su"/>
<null name="sum"/>
<null name="unique"/>
</lst>
<lst name="avr">
<double name="c">100.0</double>
<long name="count">100</long>
<null name="s"/>
<null name="sum"/>
</lst>
<lst name="cr">
<str name="ccmax">this is the secondstr9</str>
<str name="ccmin">this is the firststr0</str>
<str name="csmax">this is the second</str>
<str name="csmin">this is the first</str>
<str name="max">str9</str>
<str name="min">str0</str>
</lst>
<lst name="mr">
<long name="count">100</long>
<null name="mcm"/>
<null name="mean"/>
<null name="median"/>
<null name="su"/>
<null name="sum"/>
<null name="unique"/>
</lst>
<lst name="cdr">
<date name="cd1">1800-12-31T23:59:59Z</date>
<date name="cd2">1804-06-30T23:59:59Z</date>
<str name="cs1">1800-12-31T23:59:59Z</str>
<str name="cs2">1804-06-30T23:59:59Z</str>
</lst>
<lst name="pr">
<long name="count">100</long>
<null name="mc"/>
<null name="mean"/>
<null name="su"/>
<null name="sum"/>
<null name="unique"/>
</lst>
<lst name="csr">
<str name="cs1">this is the first</str>
<str name="cs2">this is the second</str>
<str name="cs3">this is the third</str>
</lst>
<lst name="nr">
<double name="c">-100.0</double>
<long name="count">100</long>
<null name="s"/>
<null name="sum"/>
</lst>
<lst name="cnr">
<double name="c10">10.0</double>
<double name="c8">8.0</double>
</lst>
</lst>
</response>
at __randomizedtesting.SeedInfo.seed([646717EF9CB6285C:924BBA31DD792F1B]:0)
at org.junit.Assert.fail(Assert.java:93)
at org.apache.solr.analytics.AbstractAnalyticsStatsTest.getStatResult(AbstractAnalyticsStatsTest.java:113)
at org.apache.solr.analytics.expression.ExpressionTest.addTest(ExpressionTest.java:78)
at sun.reflect.NativeMethodAccessorImpl.invoke0(Native Method)
at sun.reflect.NativeMethodAccessorImpl.invoke(NativeMethodAccessorImpl.java:57)
at sun.reflect.DelegatingMethodAccessorImpl.invoke(DelegatingMethodAccessorImpl.java:43)
at java.lang.reflect.Method.invoke(Method.java:606)
at com.carrotsearch.randomizedtesting.RandomizedRunner.invoke(RandomizedRunner.java:1559)
at com.carrotsearch.randomizedtesting.RandomizedRunner.access$600(RandomizedRunner.java:79)
at com.carrotsearch.randomizedtesting.RandomizedRunner$6.evaluate(RandomizedRunner.java:737)
at com.carrotsearch.randomizedtesting.RandomizedRunner$7.evaluate(RandomizedRunner.java:773)
at com.carrotsearch.randomizedtesting.RandomizedRunner$8.evaluate(RandomizedRunner.java:787)
at com.carrotsearch.randomizedtesting.rules.SystemPropertiesRestoreRule$1.evaluate(SystemPropertiesRestoreRule.java:53)
at org.apache.lucene.util.TestRuleSetupTeardownChained$1.evaluate(TestRuleSetupTeardownChained.java:50)
at org.apache.lucene.util.TestRuleFieldCacheSanity$1.evaluate(TestRuleFieldCacheSanity.java:51)
at org.apache.lucene.util.AbstractBeforeAfterRule$1.evaluate(AbstractBeforeAfterRule.java:46)
at com.carrotsearch.randomizedtesting.rules.SystemPropertiesInvariantRule$1.evaluate(SystemPropertiesInvariantRule.java:55)
at org.apache.lucene.util.TestRuleThreadAndTestName$1.evaluate(TestRuleThreadAndTestName.java:49)
at org.apache.lucene.util.TestRuleIgnoreAfterMaxFailures$1.evaluate(TestRuleIgnoreAfterMaxFailures.java:70)
at org.apache.lucene.util.TestRuleMarkFailure$1.evaluate(TestRuleMarkFailure.java:48)
at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
at com.carrotsearch.randomizedtesting.ThreadLeakControl$StatementRunner.run(ThreadLeakControl.java:358)
at com.carrotsearch.randomizedtesting.ThreadLeakControl.forkTimeoutingTask(ThreadLeakControl.java:782)
at com.carrotsearch.randomizedtesting.ThreadLeakControl$3.evaluate(ThreadLeakControl.java:442)
at com.carrotsearch.randomizedtesting.RandomizedRunner.runSingleTest(RandomizedRunner.java:746)
at com.carrotsearch.randomizedtesting.RandomizedRunner$3.evaluate(RandomizedRunner.java:648)
at com.carrotsearch.randomizedtesting.RandomizedRunner$4.evaluate(RandomizedRunner.java:682)
at com.carrotsearch.randomizedtesting.RandomizedRunner$5.evaluate(RandomizedRunner.java:693)
at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
at com.carrotsearch.randomizedtesting.rules.SystemPropertiesRestoreRule$1.evaluate(SystemPropertiesRestoreRule.java:53)
at org.apache.lucene.util.AbstractBeforeAfterRule$1.evaluate(AbstractBeforeAfterRule.java:46)
at org.apache.lucene.util.TestRuleStoreClassName$1.evaluate(TestRuleStoreClassName.java:42)
at com.carrotsearch.randomizedtesting.rules.SystemPropertiesInvariantRule$1.evaluate(SystemPropertiesInvariantRule.java:55)
at com.carrotsearch.randomizedtesting.rules.NoShadowingOrOverridesOnMethodsRule$1.evaluate(NoShadowingOrOverridesOnMethodsRule.java:39)
at com.carrotsearch.randomizedtesting.rules.NoShadowingOrOverridesOnMethodsRule$1.evaluate(NoShadowingOrOverridesOnMethodsRule.java:39)
at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
at org.apache.lucene.util.TestRuleAssertionsRequired$1.evaluate(TestRuleAssertionsRequired.java:43)
at org.apache.lucene.util.TestRuleMarkFailure$1.evaluate(TestRuleMarkFailure.java:48)
at org.apache.lucene.util.TestRuleIgnoreAfterMaxFailures$1.evaluate(TestRuleIgnoreAfterMaxFailures.java:70)
at org.apache.lucene.util.TestRuleIgnoreTestSuites$1.evaluate(TestRuleIgnoreTestSuites.java:55)
at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
at com.carrotsearch.randomizedtesting.ThreadLeakControl$StatementRunner.run(ThreadLeakControl.java:358)
at java.lang.Thread.run(Thread.java:744)
REGRESSION: org.apache.solr.analytics.expression.ExpressionTest.powerTest
Error Message:
Caught exception in getStatResult, xPath = /response/lst[@name='stats']/lst[@name='pr']/double[@name='sum'] raw data: <?xml version="1.0" encoding="UTF-8"?> <response> <lst name="responseHeader"> <int name="status">0</int> <int name="QTime">120</int> </lst> <result name="response" numFound="100" start="0"> </result> <lst name="stats"> <lst name="stats_fields"/> </lst> <lst name="stats"> <lst name="ar"> <long name="count">100</long> <null name="mcm"/> <null name="mean"/> <null name="median"/> <null name="su"/> <null name="sum"/> <null name="unique"/> </lst> <lst name="rr"> <str name="max">str9</str> <str name="min">str0</str> <str name="rmax">9rts</str> <str name="rmin">0rts</str> </lst> <lst name="dmr"> <str name="cma">+2MONTHS</str> <str name="cme">+2YEARS</str> <date name="dmma">1812-02-29T23:59:59Z</date> <date name="dmme">1807-12-31T23:59:59Z</date> <date name="max">1811-12-31T23:59:59Z</date> <date name="median">1805-12-31T23:59:59Z</date> </lst> <lst name="dr"> <long name="count">100</long> <null name="mc"/> <null name="mean"/> <null name="su"/> <null name="sum"/> <null name="unique"/> </lst> <lst name="avr"> <double name="c">100.0</double> <long name="count">100</long> <null name="s"/> <null name="sum"/> </lst> <lst name="cr"> <str name="ccmax">this is the secondstr9</str> <str name="ccmin">this is the firststr0</str> <str name="csmax">this is the second</str> <str name="csmin">this is the first</str> <str name="max">str9</str> <str name="min">str0</str> </lst> <lst name="mr"> <long name="count">100</long> <null name="mcm"/> <null name="mean"/> <null name="median"/> <null name="su"/> <null name="sum"/> <null name="unique"/> </lst> <lst name="cdr"> <date name="cd1">1800-12-31T23:59:59Z</date> <date name="cd2">1804-06-30T23:59:59Z</date> <str name="cs1">1800-12-31T23:59:59Z</str> <str name="cs2">1804-06-30T23:59:59Z</str> </lst> <lst name="pr"> <long name="count">100</long> <null name="mc"/> <null name="mean"/> <null name="su"/> <null name="sum"/> <null name="unique"/> </lst> <lst name="csr"> <str name="cs1">this is the first</str> <str name="cs2">this is the second</str> <str name="cs3">this is the third</str> </lst> <lst name="nr"> <double name="c">-100.0</double> <long name="count">100</long> <null name="s"/> <null name="sum"/> </lst> <lst name="cnr"> <double name="c10">10.0</double> <double name="c8">8.0</double> </lst> </lst> </response>
Stack Trace:
java.lang.AssertionError: Caught exception in getStatResult, xPath = /response/lst[@name='stats']/lst[@name='pr']/double[@name='sum']
raw data: <?xml version="1.0" encoding="UTF-8"?>
<response>
<lst name="responseHeader">
<int name="status">0</int>
<int name="QTime">120</int>
</lst>
<result name="response" numFound="100" start="0">
</result>
<lst name="stats">
<lst name="stats_fields"/>
</lst>
<lst name="stats">
<lst name="ar">
<long name="count">100</long>
<null name="mcm"/>
<null name="mean"/>
<null name="median"/>
<null name="su"/>
<null name="sum"/>
<null name="unique"/>
</lst>
<lst name="rr">
<str name="max">str9</str>
<str name="min">str0</str>
<str name="rmax">9rts</str>
<str name="rmin">0rts</str>
</lst>
<lst name="dmr">
<str name="cma">+2MONTHS</str>
<str name="cme">+2YEARS</str>
<date name="dmma">1812-02-29T23:59:59Z</date>
<date name="dmme">1807-12-31T23:59:59Z</date>
<date name="max">1811-12-31T23:59:59Z</date>
<date name="median">1805-12-31T23:59:59Z</date>
</lst>
<lst name="dr">
<long name="count">100</long>
<null name="mc"/>
<null name="mean"/>
<null name="su"/>
<null name="sum"/>
<null name="unique"/>
</lst>
<lst name="avr">
<double name="c">100.0</double>
<long name="count">100</long>
<null name="s"/>
<null name="sum"/>
</lst>
<lst name="cr">
<str name="ccmax">this is the secondstr9</str>
<str name="ccmin">this is the firststr0</str>
<str name="csmax">this is the second</str>
<str name="csmin">this is the first</str>
<str name="max">str9</str>
<str name="min">str0</str>
</lst>
<lst name="mr">
<long name="count">100</long>
<null name="mcm"/>
<null name="mean"/>
<null name="median"/>
<null name="su"/>
<null name="sum"/>
<null name="unique"/>
</lst>
<lst name="cdr">
<date name="cd1">1800-12-31T23:59:59Z</date>
<date name="cd2">1804-06-30T23:59:59Z</date>
<str name="cs1">1800-12-31T23:59:59Z</str>
<str name="cs2">1804-06-30T23:59:59Z</str>
</lst>
<lst name="pr">
<long name="count">100</long>
<null name="mc"/>
<null name="mean"/>
<null name="su"/>
<null name="sum"/>
<null name="unique"/>
</lst>
<lst name="csr">
<str name="cs1">this is the first</str>
<str name="cs2">this is the second</str>
<str name="cs3">this is the third</str>
</lst>
<lst name="nr">
<double name="c">-100.0</double>
<long name="count">100</long>
<null name="s"/>
<null name="sum"/>
</lst>
<lst name="cnr">
<double name="c10">10.0</double>
<double name="c8">8.0</double>
</lst>
</lst>
</response>
at __randomizedtesting.SeedInfo.seed([646717EF9CB6285C:AD5A0EC74A1768D]:0)
at org.junit.Assert.fail(Assert.java:93)
at org.apache.solr.analytics.AbstractAnalyticsStatsTest.getStatResult(AbstractAnalyticsStatsTest.java:113)
at org.apache.solr.analytics.expression.ExpressionTest.powerTest(ExpressionTest.java:119)
at sun.reflect.NativeMethodAccessorImpl.invoke0(Native Method)
at sun.reflect.NativeMethodAccessorImpl.invoke(NativeMethodAccessorImpl.java:57)
at sun.reflect.DelegatingMethodAccessorImpl.invoke(DelegatingMethodAccessorImpl.java:43)
at java.lang.reflect.Method.invoke(Method.java:606)
at com.carrotsearch.randomizedtesting.RandomizedRunner.invoke(RandomizedRunner.java:1559)
at com.carrotsearch.randomizedtesting.RandomizedRunner.access$600(RandomizedRunner.java:79)
at com.carrotsearch.randomizedtesting.RandomizedRunner$6.evaluate(RandomizedRunner.java:737)
at com.carrotsearch.randomizedtesting.RandomizedRunner$7.evaluate(RandomizedRunner.java:773)
at com.carrotsearch.randomizedtesting.RandomizedRunner$8.evaluate(RandomizedRunner.java:787)
at com.carrotsearch.randomizedtesting.rules.SystemPropertiesRestoreRule$1.evaluate(SystemPropertiesRestoreRule.java:53)
at org.apache.lucene.util.TestRuleSetupTeardownChained$1.evaluate(TestRuleSetupTeardownChained.java:50)
at org.apache.lucene.util.TestRuleFieldCacheSanity$1.evaluate(TestRuleFieldCacheSanity.java:51)
at org.apache.lucene.util.AbstractBeforeAfterRule$1.evaluate(AbstractBeforeAfterRule.java:46)
at com.carrotsearch.randomizedtesting.rules.SystemPropertiesInvariantRule$1.evaluate(SystemPropertiesInvariantRule.java:55)
at org.apache.lucene.util.TestRuleThreadAndTestName$1.evaluate(TestRuleThreadAndTestName.java:49)
at org.apache.lucene.util.TestRuleIgnoreAfterMaxFailures$1.evaluate(TestRuleIgnoreAfterMaxFailures.java:70)
at org.apache.lucene.util.TestRuleMarkFailure$1.evaluate(TestRuleMarkFailure.java:48)
at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
at com.carrotsearch.randomizedtesting.ThreadLeakControl$StatementRunner.run(ThreadLeakControl.java:358)
at com.carrotsearch.randomizedtesting.ThreadLeakControl.forkTimeoutingTask(ThreadLeakControl.java:782)
at com.carrotsearch.randomizedtesting.ThreadLeakControl$3.evaluate(ThreadLeakControl.java:442)
at com.carrotsearch.randomizedtesting.RandomizedRunner.runSingleTest(RandomizedRunner.java:746)
at com.carrotsearch.randomizedtesting.RandomizedRunner$3.evaluate(RandomizedRunner.java:648)
at com.carrotsearch.randomizedtesting.RandomizedRunner$4.evaluate(RandomizedRunner.java:682)
at com.carrotsearch.randomizedtesting.RandomizedRunner$5.evaluate(RandomizedRunner.java:693)
at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
at com.carrotsearch.randomizedtesting.rules.SystemPropertiesRestoreRule$1.evaluate(SystemPropertiesRestoreRule.java:53)
at org.apache.lucene.util.AbstractBeforeAfterRule$1.evaluate(AbstractBeforeAfterRule.java:46)
at org.apache.lucene.util.TestRuleStoreClassName$1.evaluate(TestRuleStoreClassName.java:42)
at com.carrotsearch.randomizedtesting.rules.SystemPropertiesInvariantRule$1.evaluate(SystemPropertiesInvariantRule.java:55)
at com.carrotsearch.randomizedtesting.rules.NoShadowingOrOverridesOnMethodsRule$1.evaluate(NoShadowingOrOverridesOnMethodsRule.java:39)
at com.carrotsearch.randomizedtesting.rules.NoShadowingOrOverridesOnMethodsRule$1.evaluate(NoShadowingOrOverridesOnMethodsRule.java:39)
at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
at org.apache.lucene.util.TestRuleAssertionsRequired$1.evaluate(TestRuleAssertionsRequired.java:43)
at org.apache.lucene.util.TestRuleMarkFailure$1.evaluate(TestRuleMarkFailure.java:48)
at org.apache.lucene.util.TestRuleIgnoreAfterMaxFailures$1.evaluate(TestRuleIgnoreAfterMaxFailures.java:70)
at org.apache.lucene.util.TestRuleIgnoreTestSuites$1.evaluate(TestRuleIgnoreTestSuites.java:55)
at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
at com.carrotsearch.randomizedtesting.ThreadLeakControl$StatementRunner.run(ThreadLeakControl.java:358)
at java.lang.Thread.run(Thread.java:744)
REGRESSION: org.apache.solr.analytics.expression.ExpressionTest.divideTest
Error Message:
Caught exception in getStatResult, xPath = /response/lst[@name='stats']/lst[@name='dr']/double[@name='sum'] raw data: <?xml version="1.0" encoding="UTF-8"?> <response> <lst name="responseHeader"> <int name="status">0</int> <int name="QTime">120</int> </lst> <result name="response" numFound="100" start="0"> </result> <lst name="stats"> <lst name="stats_fields"/> </lst> <lst name="stats"> <lst name="ar"> <long name="count">100</long> <null name="mcm"/> <null name="mean"/> <null name="median"/> <null name="su"/> <null name="sum"/> <null name="unique"/> </lst> <lst name="rr"> <str name="max">str9</str> <str name="min">str0</str> <str name="rmax">9rts</str> <str name="rmin">0rts</str> </lst> <lst name="dmr"> <str name="cma">+2MONTHS</str> <str name="cme">+2YEARS</str> <date name="dmma">1812-02-29T23:59:59Z</date> <date name="dmme">1807-12-31T23:59:59Z</date> <date name="max">1811-12-31T23:59:59Z</date> <date name="median">1805-12-31T23:59:59Z</date> </lst> <lst name="dr"> <long name="count">100</long> <null name="mc"/> <null name="mean"/> <null name="su"/> <null name="sum"/> <null name="unique"/> </lst> <lst name="avr"> <double name="c">100.0</double> <long name="count">100</long> <null name="s"/> <null name="sum"/> </lst> <lst name="cr"> <str name="ccmax">this is the secondstr9</str> <str name="ccmin">this is the firststr0</str> <str name="csmax">this is the second</str> <str name="csmin">this is the first</str> <str name="max">str9</str> <str name="min">str0</str> </lst> <lst name="mr"> <long name="count">100</long> <null name="mcm"/> <null name="mean"/> <null name="median"/> <null name="su"/> <null name="sum"/> <null name="unique"/> </lst> <lst name="cdr"> <date name="cd1">1800-12-31T23:59:59Z</date> <date name="cd2">1804-06-30T23:59:59Z</date> <str name="cs1">1800-12-31T23:59:59Z</str> <str name="cs2">1804-06-30T23:59:59Z</str> </lst> <lst name="pr"> <long name="count">100</long> <null name="mc"/> <null name="mean"/> <null name="su"/> <null name="sum"/> <null name="unique"/> </lst> <lst name="csr"> <str name="cs1">this is the first</str> <str name="cs2">this is the second</str> <str name="cs3">this is the third</str> </lst> <lst name="nr"> <double name="c">-100.0</double> <long name="count">100</long> <null name="s"/> <null name="sum"/> </lst> <lst name="cnr"> <double name="c10">10.0</double> <double name="c8">8.0</double> </lst> </lst> </response>
Stack Trace:
java.lang.AssertionError: Caught exception in getStatResult, xPath = /response/lst[@name='stats']/lst[@name='dr']/double[@name='sum']
raw data: <?xml version="1.0" encoding="UTF-8"?>
<response>
<lst name="responseHeader">
<int name="status">0</int>
<int name="QTime">120</int>
</lst>
<result name="response" numFound="100" start="0">
</result>
<lst name="stats">
<lst name="stats_fields"/>
</lst>
<lst name="stats">
<lst name="ar">
<long name="count">100</long>
<null name="mcm"/>
<null name="mean"/>
<null name="median"/>
<null name="su"/>
<null name="sum"/>
<null name="unique"/>
</lst>
<lst name="rr">
<str name="max">str9</str>
<str name="min">str0</str>
<str name="rmax">9rts</str>
<str name="rmin">0rts</str>
</lst>
<lst name="dmr">
<str name="cma">+2MONTHS</str>
<str name="cme">+2YEARS</str>
<date name="dmma">1812-02-29T23:59:59Z</date>
<date name="dmme">1807-12-31T23:59:59Z</date>
<date name="max">1811-12-31T23:59:59Z</date>
<date name="median">1805-12-31T23:59:59Z</date>
</lst>
<lst name="dr">
<long name="count">100</long>
<null name="mc"/>
<null name="mean"/>
<null name="su"/>
<null name="sum"/>
<null name="unique"/>
</lst>
<lst name="avr">
<double name="c">100.0</double>
<long name="count">100</long>
<null name="s"/>
<null name="sum"/>
</lst>
<lst name="cr">
<str name="ccmax">this is the secondstr9</str>
<str name="ccmin">this is the firststr0</str>
<str name="csmax">this is the second</str>
<str name="csmin">this is the first</str>
<str name="max">str9</str>
<str name="min">str0</str>
</lst>
<lst name="mr">
<long name="count">100</long>
<null name="mcm"/>
<null name="mean"/>
<null name="median"/>
<null name="su"/>
<null name="sum"/>
<null name="unique"/>
</lst>
<lst name="cdr">
<date name="cd1">1800-12-31T23:59:59Z</date>
<date name="cd2">1804-06-30T23:59:59Z</date>
<str name="cs1">1800-12-31T23:59:59Z</str>
<str name="cs2">1804-06-30T23:59:59Z</str>
</lst>
<lst name="pr">
<long name="count">100</long>
<null name="mc"/>
<null name="mean"/>
<null name="su"/>
<null name="sum"/>
<null name="unique"/>
</lst>
<lst name="csr">
<str name="cs1">this is the first</str>
<str name="cs2">this is the second</str>
<str name="cs3">this is the third</str>
</lst>
<lst name="nr">
<double name="c">-100.0</double>
<long name="count">100</long>
<null name="s"/>
<null name="sum"/>
</lst>
<lst name="cnr">
<double name="c10">10.0</double>
<double name="c8">8.0</double>
</lst>
</lst>
</response>
at __randomizedtesting.SeedInfo.seed([646717EF9CB6285C:3C6AFC19B8744A8A]:0)
at org.junit.Assert.fail(Assert.java:93)
at org.apache.solr.analytics.AbstractAnalyticsStatsTest.getStatResult(AbstractAnalyticsStatsTest.java:113)
at org.apache.solr.analytics.expression.ExpressionTest.divideTest(ExpressionTest.java:106)
at sun.reflect.NativeMethodAccessorImpl.invoke0(Native Method)
at sun.reflect.NativeMethodAccessorImpl.invoke(NativeMethodAccessorImpl.java:57)
at sun.reflect.DelegatingMethodAccessorImpl.invoke(DelegatingMethodAccessorImpl.java:43)
at java.lang.reflect.Method.invoke(Method.java:606)
at com.carrotsearch.randomizedtesting.RandomizedRunner.invoke(RandomizedRunner.java:1559)
at com.carrotsearch.randomizedtesting.RandomizedRunner.access$600(RandomizedRunner.java:79)
at com.carrotsearch.randomizedtesting.RandomizedRunner$6.evaluate(RandomizedRunner.java:737)
at com.carrotsearch.randomizedtesting.RandomizedRunner$7.evaluate(RandomizedRunner.java:773)
at com.carrotsearch.randomizedtesting.RandomizedRunner$8.evaluate(RandomizedRunner.java:787)
at com.carrotsearch.randomizedtesting.rules.SystemPropertiesRestoreRule$1.evaluate(SystemPropertiesRestoreRule.java:53)
at org.apache.lucene.util.TestRuleSetupTeardownChained$1.evaluate(TestRuleSetupTeardownChained.java:50)
at org.apache.lucene.util.TestRuleFieldCacheSanity$1.evaluate(TestRuleFieldCacheSanity.java:51)
at org.apache.lucene.util.AbstractBeforeAfterRule$1.evaluate(AbstractBeforeAfterRule.java:46)
at com.carrotsearch.randomizedtesting.rules.SystemPropertiesInvariantRule$1.evaluate(SystemPropertiesInvariantRule.java:55)
at org.apache.lucene.util.TestRuleThreadAndTestName$1.evaluate(TestRuleThreadAndTestName.java:49)
at org.apache.lucene.util.TestRuleIgnoreAfterMaxFailures$1.evaluate(TestRuleIgnoreAfterMaxFailures.java:70)
at org.apache.lucene.util.TestRuleMarkFailure$1.evaluate(TestRuleMarkFailure.java:48)
at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
at com.carrotsearch.randomizedtesting.ThreadLeakControl$StatementRunner.run(ThreadLeakControl.java:358)
at com.carrotsearch.randomizedtesting.ThreadLeakControl.forkTimeoutingTask(ThreadLeakControl.java:782)
at com.carrotsearch.randomizedtesting.ThreadLeakControl$3.evaluate(ThreadLeakControl.java:442)
at com.carrotsearch.randomizedtesting.RandomizedRunner.runSingleTest(RandomizedRunner.java:746)
at com.carrotsearch.randomizedtesting.RandomizedRunner$3.evaluate(RandomizedRunner.java:648)
at com.carrotsearch.randomizedtesting.RandomizedRunner$4.evaluate(RandomizedRunner.java:682)
at com.carrotsearch.randomizedtesting.RandomizedRunner$5.evaluate(RandomizedRunner.java:693)
at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
at com.carrotsearch.randomizedtesting.rules.SystemPropertiesRestoreRule$1.evaluate(SystemPropertiesRestoreRule.java:53)
at org.apache.lucene.util.AbstractBeforeAfterRule$1.evaluate(AbstractBeforeAfterRule.java:46)
at org.apache.lucene.util.TestRuleStoreClassName$1.evaluate(TestRuleStoreClassName.java:42)
at com.carrotsearch.randomizedtesting.rules.SystemPropertiesInvariantRule$1.evaluate(SystemPropertiesInvariantRule.java:55)
at com.carrotsearch.randomizedtesting.rules.NoShadowingOrOverridesOnMethodsRule$1.evaluate(NoShadowingOrOverridesOnMethodsRule.java:39)
at com.carrotsearch.randomizedtesting.rules.NoShadowingOrOverridesOnMethodsRule$1.evaluate(NoShadowingOrOverridesOnMethodsRule.java:39)
at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
at org.apache.lucene.util.TestRuleAssertionsRequired$1.evaluate(TestRuleAssertionsRequired.java:43)
at org.apache.lucene.util.TestRuleMarkFailure$1.evaluate(TestRuleMarkFailure.java:48)
at org.apache.lucene.util.TestRuleIgnoreAfterMaxFailures$1.evaluate(TestRuleIgnoreAfterMaxFailures.java:70)
at org.apache.lucene.util.TestRuleIgnoreTestSuites$1.evaluate(TestRuleIgnoreTestSuites.java:55)
at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
at com.carrotsearch.randomizedtesting.ThreadLeakControl$StatementRunner.run(ThreadLeakControl.java:358)
at java.lang.Thread.run(Thread.java:744)
REGRESSION: org.apache.solr.analytics.expression.ExpressionTest.multiplyTest
Error Message:
Caught exception in getStatResult, xPath = /response/lst[@name='stats']/lst[@name='mr']/double[@name='sum'] raw data: <?xml version="1.0" encoding="UTF-8"?> <response> <lst name="responseHeader"> <int name="status">0</int> <int name="QTime">120</int> </lst> <result name="response" numFound="100" start="0"> </result> <lst name="stats"> <lst name="stats_fields"/> </lst> <lst name="stats"> <lst name="ar"> <long name="count">100</long> <null name="mcm"/> <null name="mean"/> <null name="median"/> <null name="su"/> <null name="sum"/> <null name="unique"/> </lst> <lst name="rr"> <str name="max">str9</str> <str name="min">str0</str> <str name="rmax">9rts</str> <str name="rmin">0rts</str> </lst> <lst name="dmr"> <str name="cma">+2MONTHS</str> <str name="cme">+2YEARS</str> <date name="dmma">1812-02-29T23:59:59Z</date> <date name="dmme">1807-12-31T23:59:59Z</date> <date name="max">1811-12-31T23:59:59Z</date> <date name="median">1805-12-31T23:59:59Z</date> </lst> <lst name="dr"> <long name="count">100</long> <null name="mc"/> <null name="mean"/> <null name="su"/> <null name="sum"/> <null name="unique"/> </lst> <lst name="avr"> <double name="c">100.0</double> <long name="count">100</long> <null name="s"/> <null name="sum"/> </lst> <lst name="cr"> <str name="ccmax">this is the secondstr9</str> <str name="ccmin">this is the firststr0</str> <str name="csmax">this is the second</str> <str name="csmin">this is the first</str> <str name="max">str9</str> <str name="min">str0</str> </lst> <lst name="mr"> <long name="count">100</long> <null name="mcm"/> <null name="mean"/> <null name="median"/> <null name="su"/> <null name="sum"/> <null name="unique"/> </lst> <lst name="cdr"> <date name="cd1">1800-12-31T23:59:59Z</date> <date name="cd2">1804-06-30T23:59:59Z</date> <str name="cs1">1800-12-31T23:59:59Z</str> <str name="cs2">1804-06-30T23:59:59Z</str> </lst> <lst name="pr"> <long name="count">100</long> <null name="mc"/> <null name="mean"/> <null name="su"/> <null name="sum"/> <null name="unique"/> </lst> <lst name="csr"> <str name="cs1">this is the first</str> <str name="cs2">this is the second</str> <str name="cs3">this is the third</str> </lst> <lst name="nr"> <double name="c">-100.0</double> <long name="count">100</long> <null name="s"/> <null name="sum"/> </lst> <lst name="cnr"> <double name="c10">10.0</double> <double name="c8">8.0</double> </lst> </lst> </response>
Stack Trace:
java.lang.AssertionError: Caught exception in getStatResult, xPath = /response/lst[@name='stats']/lst[@name='mr']/double[@name='sum']
raw data: <?xml version="1.0" encoding="UTF-8"?>
<response>
<lst name="responseHeader">
<int name="status">0</int>
<int name="QTime">120</int>
</lst>
<result name="response" numFound="100" start="0">
</result>
<lst name="stats">
<lst name="stats_fields"/>
</lst>
<lst name="stats">
<lst name="ar">
<long name="count">100</long>
<null name="mcm"/>
<null name="mean"/>
<null name="median"/>
<null name="su"/>
<null name="sum"/>
<null name="unique"/>
</lst>
<lst name="rr">
<str name="max">str9</str>
<str name="min">str0</str>
<str name="rmax">9rts</str>
<str name="rmin">0rts</str>
</lst>
<lst name="dmr">
<str name="cma">+2MONTHS</str>
<str name="cme">+2YEARS</str>
<date name="dmma">1812-02-29T23:59:59Z</date>
<date name="dmme">1807-12-31T23:59:59Z</date>
<date name="max">1811-12-31T23:59:59Z</date>
<date name="median">1805-12-31T23:59:59Z</date>
</lst>
<lst name="dr">
<long name="count">100</long>
<null name="mc"/>
<null name="mean"/>
<null name="su"/>
<null name="sum"/>
<null name="unique"/>
</lst>
<lst name="avr">
<double name="c">100.0</double>
<long name="count">100</long>
<null name="s"/>
<null name="sum"/>
</lst>
<lst name="cr">
<str name="ccmax">this is the secondstr9</str>
<str name="ccmin">this is the firststr0</str>
<str name="csmax">this is the second</str>
<str name="csmin">this is the first</str>
<str name="max">str9</str>
<str name="min">str0</str>
</lst>
<lst name="mr">
<long name="count">100</long>
<null name="mcm"/>
<null name="mean"/>
<null name="median"/>
<null name="su"/>
<null name="sum"/>
<null name="unique"/>
</lst>
<lst name="cdr">
<date name="cd1">1800-12-31T23:59:59Z</date>
<date name="cd2">1804-06-30T23:59:59Z</date>
<str name="cs1">1800-12-31T23:59:59Z</str>
<str name="cs2">1804-06-30T23:59:59Z</str>
</lst>
<lst name="pr">
<long name="count">100</long>
<null name="mc"/>
<null name="mean"/>
<null name="su"/>
<null name="sum"/>
<null name="unique"/>
</lst>
<lst name="csr">
<str name="cs1">this is the first</str>
<str name="cs2">this is the second</str>
<str name="cs3">this is the third</str>
</lst>
<lst name="nr">
<double name="c">-100.0</double>
<long name="count">100</long>
<null name="s"/>
<null name="sum"/>
</lst>
<lst name="cnr">
<double name="c10">10.0</double>
<double name="c8">8.0</double>
</lst>
</lst>
</response>
at __randomizedtesting.SeedInfo.seed([646717EF9CB6285C:FE60991A9B81E32]:0)
at org.junit.Assert.fail(Assert.java:93)
at org.apache.solr.analytics.AbstractAnalyticsStatsTest.getStatResult(AbstractAnalyticsStatsTest.java:113)
at org.apache.solr.analytics.expression.ExpressionTest.multiplyTest(ExpressionTest.java:92)
at sun.reflect.NativeMethodAccessorImpl.invoke0(Native Method)
at sun.reflect.NativeMethodAccessorImpl.invoke(NativeMethodAccessorImpl.java:57)
at sun.reflect.DelegatingMethodAccessorImpl.invoke(DelegatingMethodAccessorImpl.java:43)
at java.lang.reflect.Method.invoke(Method.java:606)
at com.carrotsearch.randomizedtesting.RandomizedRunner.invoke(RandomizedRunner.java:1559)
at com.carrotsearch.randomizedtesting.RandomizedRunner.access$600(RandomizedRunner.java:79)
at com.carrotsearch.randomizedtesting.RandomizedRunner$6.evaluate(RandomizedRunner.java:737)
at com.carrotsearch.randomizedtesting.RandomizedRunner$7.evaluate(RandomizedRunner.java:773)
at com.carrotsearch.randomizedtesting.RandomizedRunner$8.evaluate(RandomizedRunner.java:787)
at com.carrotsearch.randomizedtesting.rules.SystemPropertiesRestoreRule$1.evaluate(SystemPropertiesRestoreRule.java:53)
at org.apache.lucene.util.TestRuleSetupTeardownChained$1.evaluate(TestRuleSetupTeardownChained.java:50)
at org.apache.lucene.util.TestRuleFieldCacheSanity$1.evaluate(TestRuleFieldCacheSanity.java:51)
at org.apache.lucene.util.AbstractBeforeAfterRule$1.evaluate(AbstractBeforeAfterRule.java:46)
at com.carrotsearch.randomizedtesting.rules.SystemPropertiesInvariantRule$1.evaluate(SystemPropertiesInvariantRule.java:55)
at org.apache.lucene.util.TestRuleThreadAndTestName$1.evaluate(TestRuleThreadAndTestName.java:49)
at org.apache.lucene.util.TestRuleIgnoreAfterMaxFailures$1.evaluate(TestRuleIgnoreAfterMaxFailures.java:70)
at org.apache.lucene.util.TestRuleMarkFailure$1.evaluate(TestRuleMarkFailure.java:48)
at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
at com.carrotsearch.randomizedtesting.ThreadLeakControl$StatementRunner.run(ThreadLeakControl.java:358)
at com.carrotsearch.randomizedtesting.ThreadLeakControl.forkTimeoutingTask(ThreadLeakControl.java:782)
at com.carrotsearch.randomizedtesting.ThreadLeakControl$3.evaluate(ThreadLeakControl.java:442)
at com.carrotsearch.randomizedtesting.RandomizedRunner.runSingleTest(RandomizedRunner.java:746)
at com.carrotsearch.randomizedtesting.RandomizedRunner$3.evaluate(RandomizedRunner.java:648)
at com.carrotsearch.randomizedtesting.RandomizedRunner$4.evaluate(RandomizedRunner.java:682)
at com.carrotsearch.randomizedtesting.RandomizedRunner$5.evaluate(RandomizedRunner.java:693)
at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
at com.carrotsearch.randomizedtesting.rules.SystemPropertiesRestoreRule$1.evaluate(SystemPropertiesRestoreRule.java:53)
at org.apache.lucene.util.AbstractBeforeAfterRule$1.evaluate(AbstractBeforeAfterRule.java:46)
at org.apache.lucene.util.TestRuleStoreClassName$1.evaluate(TestRuleStoreClassName.java:42)
at com.carrotsearch.randomizedtesting.rules.SystemPropertiesInvariantRule$1.evaluate(SystemPropertiesInvariantRule.java:55)
at com.carrotsearch.randomizedtesting.rules.NoShadowingOrOverridesOnMethodsRule$1.evaluate(NoShadowingOrOverridesOnMethodsRule.java:39)
at com.carrotsearch.randomizedtesting.rules.NoShadowingOrOverridesOnMethodsRule$1.evaluate(NoShadowingOrOverridesOnMethodsRule.java:39)
at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
at org.apache.lucene.util.TestRuleAssertionsRequired$1.evaluate(TestRuleAssertionsRequired.java:43)
at org.apache.lucene.util.TestRuleMarkFailure$1.evaluate(TestRuleMarkFailure.java:48)
at org.apache.lucene.util.TestRuleIgnoreAfterMaxFailures$1.evaluate(TestRuleIgnoreAfterMaxFailures.java:70)
at org.apache.lucene.util.TestRuleIgnoreTestSuites$1.evaluate(TestRuleIgnoreTestSuites.java:55)
at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
at com.carrotsearch.randomizedtesting.ThreadLeakControl$StatementRunner.run(ThreadLeakControl.java:358)
at java.lang.Thread.run(Thread.java:744)
REGRESSION: org.apache.solr.cloud.CollectionsAPIDistributedZkTest.testDistribSearch
Error Message:
Stack Trace:
java.lang.AssertionError
at __randomizedtesting.SeedInfo.seed([646717EF9CB6285C:E58199F7EBE94860]:0)
at org.junit.Assert.fail(Assert.java:92)
at org.junit.Assert.assertTrue(Assert.java:43)
at org.junit.Assert.assertFalse(Assert.java:68)
at org.junit.Assert.assertFalse(Assert.java:79)
at org.apache.solr.cloud.CollectionsAPIDistributedZkTest.deleteCollectionWithDownNodes(CollectionsAPIDistributedZkTest.java:390)
at org.apache.solr.cloud.CollectionsAPIDistributedZkTest.doTest(CollectionsAPIDistributedZkTest.java:203)
at org.apache.solr.BaseDistributedSearchTestCase.testDistribSearch(BaseDistributedSearchTestCase.java:867)
at sun.reflect.NativeMethodAccessorImpl.invoke0(Native Method)
at sun.reflect.NativeMethodAccessorImpl.invoke(NativeMethodAccessorImpl.java:57)
at sun.reflect.DelegatingMethodAccessorImpl.invoke(DelegatingMethodAccessorImpl.java:43)
at java.lang.reflect.Method.invoke(Method.java:606)
at com.carrotsearch.randomizedtesting.RandomizedRunner.invoke(RandomizedRunner.java:1559)
at com.carrotsearch.randomizedtesting.RandomizedRunner.access$600(RandomizedRunner.java:79)
at com.carrotsearch.randomizedtesting.RandomizedRunner$6.evaluate(RandomizedRunner.java:737)
at com.carrotsearch.randomizedtesting.RandomizedRunner$7.evaluate(RandomizedRunner.java:773)
at com.carrotsearch.randomizedtesting.RandomizedRunner$8.evaluate(RandomizedRunner.java:787)
at com.carrotsearch.randomizedtesting.rules.SystemPropertiesRestoreRule$1.evaluate(SystemPropertiesRestoreRule.java:53)
at org.apache.lucene.util.TestRuleSetupTeardownChained$1.evaluate(TestRuleSetupTeardownChained.java:50)
at org.apache.lucene.util.TestRuleFieldCacheSanity$1.evaluate(TestRuleFieldCacheSanity.java:51)
at org.apache.lucene.util.AbstractBeforeAfterRule$1.evaluate(AbstractBeforeAfterRule.java:46)
at com.carrotsearch.randomizedtesting.rules.SystemPropertiesInvariantRule$1.evaluate(SystemPropertiesInvariantRule.java:55)
at org.apache.lucene.util.TestRuleThreadAndTestName$1.evaluate(TestRuleThreadAndTestName.java:49)
at org.apache.lucene.util.TestRuleIgnoreAfterMaxFailures$1.evaluate(TestRuleIgnoreAfterMaxFailures.java:70)
at org.apache.lucene.util.TestRuleMarkFailure$1.evaluate(TestRuleMarkFailure.java:48)
at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
at com.carrotsearch.randomizedtesting.ThreadLeakControl$StatementRunner.run(ThreadLeakControl.java:358)
at com.carrotsearch.randomizedtesting.ThreadLeakControl.forkTimeoutingTask(ThreadLeakControl.java:782)
at com.carrotsearch.randomizedtesting.ThreadLeakControl$3.evaluate(ThreadLeakControl.java:442)
at com.carrotsearch.randomizedtesting.RandomizedRunner.runSingleTest(RandomizedRunner.java:746)
at com.carrotsearch.randomizedtesting.RandomizedRunner$3.evaluate(RandomizedRunner.java:648)
at com.carrotsearch.randomizedtesting.RandomizedRunner$4.evaluate(RandomizedRunner.java:682)
at com.carrotsearch.randomizedtesting.RandomizedRunner$5.evaluate(RandomizedRunner.java:693)
at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
at com.carrotsearch.randomizedtesting.rules.SystemPropertiesRestoreRule$1.evaluate(SystemPropertiesRestoreRule.java:53)
at org.apache.lucene.util.AbstractBeforeAfterRule$1.evaluate(AbstractBeforeAfterRule.java:46)
at org.apache.lucene.util.TestRuleStoreClassName$1.evaluate(TestRuleStoreClassName.java:42)
at com.carrotsearch.randomizedtesting.rules.SystemPropertiesInvariantRule$1.evaluate(SystemPropertiesInvariantRule.java:55)
at com.carrotsearch.randomizedtesting.rules.NoShadowingOrOverridesOnMethodsRule$1.evaluate(NoShadowingOrOverridesOnMethodsRule.java:39)
at com.carrotsearch.randomizedtesting.rules.NoShadowingOrOverridesOnMethodsRule$1.evaluate(NoShadowingOrOverridesOnMethodsRule.java:39)
at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
at org.apache.lucene.util.TestRuleAssertionsRequired$1.evaluate(TestRuleAssertionsRequired.java:43)
at org.apache.lucene.util.TestRuleMarkFailure$1.evaluate(TestRuleMarkFailure.java:48)
at org.apache.lucene.util.TestRuleIgnoreAfterMaxFailures$1.evaluate(TestRuleIgnoreAfterMaxFailures.java:70)
at org.apache.lucene.util.TestRuleIgnoreTestSuites$1.evaluate(TestRuleIgnoreTestSuites.java:55)
at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
at com.carrotsearch.randomizedtesting.ThreadLeakControl$StatementRunner.run(ThreadLeakControl.java:358)
at java.lang.Thread.run(Thread.java:744)
Build Log:
[...truncated 9910 lines...]
[junit4] Suite: org.apache.solr.analytics.expression.ExpressionTest
[junit4] 2> 39704 T288 oas.SolrTestCaseJ4.initCore ####initCore
[junit4] 2> Creating dataDir: /mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build/solr-core/test/J0/./solrtest-ExpressionTest-1390079615468
[junit4] 2> 39704 T288 oasc.SolrResourceLoader.<init> new SolrResourceLoader for directory: '/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build/solr-core/test-files/solr/collection1/'
[junit4] 2> 39705 T288 oasc.SolrResourceLoader.replaceClassLoader Adding 'file:/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build/solr-core/test-files/solr/collection1/lib/classes/' to classloader
[junit4] 2> 39705 T288 oasc.SolrResourceLoader.replaceClassLoader Adding 'file:/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build/solr-core/test-files/solr/collection1/lib/README' to classloader
[junit4] 2> 39735 T288 oasc.SolrConfig.<init> Using Lucene MatchVersion: LUCENE_50
[junit4] 2> 39757 T288 oasc.SolrConfig.<init> Loaded SolrConfig: solrconfig-basic.xml
[junit4] 2> 39758 T288 oass.IndexSchema.readSchema Reading Solr Schema from schema-analytics.xml
[junit4] 2> 39763 T288 oass.IndexSchema.readSchema [null] Schema name=schema-docValues
[junit4] 2> 39782 T288 oass.IndexSchema.readSchema unique key field: id
[junit4] 2> 39783 T288 oasc.SolrResourceLoader.locateSolrHome JNDI not configured for solr (NoInitialContextEx)
[junit4] 2> 39783 T288 oasc.SolrResourceLoader.locateSolrHome using system property solr.solr.home: /mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build/solr-core/test-files/solr
[junit4] 2> 39783 T288 oasc.SolrResourceLoader.<init> new SolrResourceLoader for directory: '/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build/solr-core/test-files/solr/'
[junit4] 2> 39793 T288 oasc.SolrResourceLoader.locateSolrHome JNDI not configured for solr (NoInitialContextEx)
[junit4] 2> 39793 T288 oasc.SolrResourceLoader.locateSolrHome using system property solr.solr.home: /mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build/solr-core/test-files/solr
[junit4] 2> 39793 T288 oasc.SolrResourceLoader.<init> new SolrResourceLoader for deduced Solr Home: '/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build/solr-core/test-files/solr/'
[junit4] 2> 39830 T288 oasc.CoreContainer.<init> New CoreContainer 993420612
[junit4] 2> 39831 T288 oasc.CoreContainer.load Loading cores into CoreContainer [instanceDir=/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build/solr-core/test-files/solr/]
[junit4] 2> 39831 T288 oashc.HttpShardHandlerFactory.getParameter Setting socketTimeout to: 0
[junit4] 2> 39832 T288 oashc.HttpShardHandlerFactory.getParameter Setting urlScheme to: http://
[junit4] 2> 39832 T288 oashc.HttpShardHandlerFactory.getParameter Setting connTimeout to: 0
[junit4] 2> 39832 T288 oashc.HttpShardHandlerFactory.getParameter Setting maxConnectionsPerHost to: 20
[junit4] 2> 39832 T288 oashc.HttpShardHandlerFactory.getParameter Setting corePoolSize to: 0
[junit4] 2> 39832 T288 oashc.HttpShardHandlerFactory.getParameter Setting maximumPoolSize to: 2147483647
[junit4] 2> 39833 T288 oashc.HttpShardHandlerFactory.getParameter Setting maxThreadIdleTime to: 5
[junit4] 2> 39833 T288 oashc.HttpShardHandlerFactory.getParameter Setting sizeOfQueue to: -1
[junit4] 2> 39833 T288 oashc.HttpShardHandlerFactory.getParameter Setting fairnessPolicy to: false
[junit4] 2> 39836 T288 oasl.LogWatcher.createWatcher SLF4J impl is org.slf4j.impl.Log4jLoggerFactory
[junit4] 2> 39836 T288 oasl.LogWatcher.newRegisteredLogWatcher Registering Log Listener [Log4j (org.slf4j.impl.Log4jLoggerFactory)]
[junit4] 2> 39836 T288 oasc.CoreContainer.load Host Name:
[junit4] 2> 39839 T289 oasc.CoreContainer.create Creating SolrCore 'collection1' using instanceDir: /mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build/solr-core/test-files/solr/collection1
[junit4] 2> 39840 T289 oasc.SolrResourceLoader.<init> new SolrResourceLoader for directory: '/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build/solr-core/test-files/solr/collection1/'
[junit4] 2> 39840 T289 oasc.SolrResourceLoader.replaceClassLoader Adding 'file:/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build/solr-core/test-files/solr/collection1/lib/classes/' to classloader
[junit4] 2> 39840 T289 oasc.SolrResourceLoader.replaceClassLoader Adding 'file:/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build/solr-core/test-files/solr/collection1/lib/README' to classloader
[junit4] 2> 39866 T289 oasc.SolrConfig.<init> Using Lucene MatchVersion: LUCENE_50
[junit4] 2> 39886 T289 oasc.SolrConfig.<init> Loaded SolrConfig: solrconfig-basic.xml
[junit4] 2> 39886 T289 oass.IndexSchema.readSchema Reading Solr Schema from schema-analytics.xml
[junit4] 2> 39891 T289 oass.IndexSchema.readSchema [collection1] Schema name=schema-docValues
[junit4] 2> 39908 T289 oass.IndexSchema.readSchema unique key field: id
[junit4] 2> 39909 T289 oasc.SolrCore.initDirectoryFactory org.apache.solr.core.MockDirectoryFactory
[junit4] 2> 39909 T289 oasc.SolrCore.<init> [collection1] Opening new SolrCore at /mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build/solr-core/test-files/solr/collection1/, dataDir=/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build/solr-core/test/J0/./solrtest-ExpressionTest-1390079615468/
[junit4] 2> 39909 T289 oasc.SolrCore.<init> JMX monitoring not detected for core: collection1
[junit4] 2> 39910 T289 oasc.CachingDirectoryFactory.get return new directory for /mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build/solr-core/test/J0/./solrtest-ExpressionTest-1390079615468
[junit4] 2> 39910 T289 oasc.SolrCore.getNewIndexDir New index directory detected: old=null new=/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build/solr-core/test/J0/./solrtest-ExpressionTest-1390079615468/index/
[junit4] 2> 39910 T289 oasc.SolrCore.initIndex WARN [collection1] Solr index directory '/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build/solr-core/test/J0/./solrtest-ExpressionTest-1390079615468/index' doesn't exist. Creating new index...
[junit4] 2> 39910 T289 oasc.CachingDirectoryFactory.get return new directory for /mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build/solr-core/test/J0/./solrtest-ExpressionTest-1390079615468/index
[junit4] 2> 39911 T289 oasu.RandomMergePolicy.<init> RandomMergePolicy wrapping class org.apache.lucene.index.LogByteSizeMergePolicy: [LogByteSizeMergePolicy: minMergeSize=1677721, mergeFactor=15, maxMergeSize=2147483648, maxMergeSizeForForcedMerge=9223372036854775807, calibrateSizeByDeletes=false, maxMergeDocs=2147483647, maxCFSSegmentSizeMB=8.796093022207999E12, noCFSRatio=0.7608624946088448]
[junit4] 2> 39911 T289 oasc.SolrDeletionPolicy.onCommit SolrDeletionPolicy.onCommit: commits: num=1
[junit4] 2> commit{dir=MockDirectoryWrapper(org.apache.lucene.store.RAMDirectory@2229ce0c lockFactory=org.apache.lucene.store.SingleInstanceLockFactory@7044189b),segFN=segments_1,generation=1}
[junit4] 2> 39912 T289 oasc.SolrDeletionPolicy.updateCommits newest commit generation = 1
[junit4] 2> 39912 T289 oasc.SolrCore.loadUpdateProcessorChains no updateRequestProcessorChain defined as default, creating implicit default
[junit4] 2> 39913 T289 oasc.RequestHandlers.initHandlersFromConfig created standard: solr.StandardRequestHandler
[junit4] 2> 39913 T289 oasc.RequestHandlers.initHandlersFromConfig created /update: solr.UpdateRequestHandler
[junit4] 2> 39915 T289 oashl.XMLLoader.init xsltCacheLifetimeSeconds=60
[junit4] 2> 39916 T289 oasu.CommitTracker.<init> Hard AutoCommit: disabled
[junit4] 2> 39917 T289 oasu.CommitTracker.<init> Soft AutoCommit: disabled
[junit4] 2> 39917 T289 oasu.RandomMergePolicy.<init> RandomMergePolicy wrapping class org.apache.lucene.index.LogDocMergePolicy: [LogDocMergePolicy: minMergeSize=1000, mergeFactor=29, maxMergeSize=9223372036854775807, maxMergeSizeForForcedMerge=9223372036854775807, calibrateSizeByDeletes=true, maxMergeDocs=2147483647, maxCFSSegmentSizeMB=8.796093022207999E12, noCFSRatio=0.45445994261769973]
[junit4] 2> 39917 T289 oasc.SolrDeletionPolicy.onInit SolrDeletionPolicy.onInit: commits: num=1
[junit4] 2> commit{dir=MockDirectoryWrapper(org.apache.lucene.store.RAMDirectory@2229ce0c lockFactory=org.apache.lucene.store.SingleInstanceLockFactory@7044189b),segFN=segments_1,generation=1}
[junit4] 2> 39918 T289 oasc.SolrDeletionPolicy.updateCommits newest commit generation = 1
[junit4] 2> 39918 T289 oass.SolrIndexSearcher.<init> Opening Searcher@362b0e77 main
[junit4] 2> 39918 T289 oasc.CoreContainer.registerCore registering core: collection1
[junit4] 2> 39918 T290 oasc.SolrCore.registerSearcher [collection1] Registered new searcher Searcher@362b0e77 main{StandardDirectoryReader(segments_1:1:nrt)}
[junit4] 2> 39920 T288 oas.SolrTestCaseJ4.initCore ####initCore end
[junit4] 2> ASYNC NEW_CORE C43 name=collection1 org.apache.solr.core.SolrCore@5173640c
[junit4] 2> 39920 T288 C43 oasu.DirectUpdateHandler2.deleteAll [collection1] REMOVING ALL DOCUMENTS FROM INDEX
[junit4] 2> 39921 T288 C43 oasup.LogUpdateProcessor.finish [collection1] webapp=null path=null params={} {deleteByQuery=*:*} 0 1
[junit4] 2> 39927 T288 C43 oasup.LogUpdateProcessor.finish [collection1] webapp=null path=null params={} {add=[10000]} 0 6
[junit4] 2> 39933 T288 C43 oasup.LogUpdateProcessor.finish [collection1] webapp=null path=null params={} {add=[10001]} 0 2
[junit4] 2> 39936 T288 C43 oasup.LogUpdateProcessor.finish [collection1] webapp=null path=null params={} {add=[10002]} 0 2
[junit4] 2> 39940 T288 C43 oasup.LogUpdateProcessor.finish [collection1] webapp=null path=null params={} {add=[10003]} 0 2
[junit4] 2> 39943 T288 C43 oasup.LogUpdateProcessor.finish [collection1] webapp=null path=null params={} {add=[10004]} 0 2
[junit4] 2> 39946 T288 C43 oasup.LogUpdateProcessor.finish [collection1] webapp=null path=null params={} {add=[10005]} 0 2
[junit4] 2> 39949 T288 C43 oasup.LogUpdateProcessor.finish [collection1] webapp=null path=null params={} {add=[10006]} 0 1
[junit4] 2> 39952 T288 C43 oasup.LogUpdateProcessor.finish [collection1] webapp=null path=null params={} {add=[10007]} 0 1
[junit4] 2> 39955 T288 C43 oasup.LogUpdateProcessor.finish [collection1] webapp=null path=null params={} {add=[10008]} 0 1
[junit4] 2> 39957 T288 C43 oasup.LogUpdateProcessor.finish [collection1] webapp=null path=null params={} {add=[10009]} 0 1
[junit4] 2> 39959 T288 C43 oasup.LogUpdateProcessor.finish [collection1] webapp=null path=null params={} {add=[100010]} 0 1
[junit4] 2> 39961 T288 C43 oasup.LogUpdateProcessor.finish [collection1] webapp=null path=null params={} {add=[100011]} 0 1
[junit4] 2> 39963 T288 C43 oasup.LogUpdateProcessor.finish [collection1] webapp=null path=null params={} {add=[100012]} 0 1
[junit4] 2> 39965 T288 C43 oasup.LogUpdateProcessor.finish [collection1] webapp=null path=null params={} {add=[100013]} 0 1
[junit4] 2> 39967 T288 C43 oasup.LogUpdateProcessor.finish [collection1] webapp=null path=null params={} {add=[100014]} 0 1
[junit4] 2> 39969 T288 C43 oasup.LogUpdateProcessor.finish [collection1] webapp=null path=null params={} {add=[100015]} 0 1
[junit4] 2> 39971 T288 C43 oasup.LogUpdateProcessor.finish [collection1] webapp=null path=null params={} {add=[100016]} 0 1
[junit4] 2> 39973 T288 C43 oasup.LogUpdateProcessor.finish [collection1] webapp=null path=null params={} {add=[100017]} 0 1
[junit4] 2> 39975 T288 C43 oasup.LogUpdateProcessor.finish [collection1] webapp=null path=null params={} {add=[100018]} 0 1
[junit4] 2> 39977 T288 C43 oasup.LogUpdateProcessor.finish [collection1] webapp=null path=null params={} {add=[100019]} 0 1
[junit4] 2> 39979 T288 C43 oasup.LogUpdateProcessor.finish [collection1] webapp=null path=null params={} {add=[100020]} 0 1
[junit4] 2> 39981 T288 C43 oasup.LogUpdateProcessor.finish [collection1] webapp=null path=null params={} {add=[100021]} 0 1
[junit4] 2> 39982 T288 C43 oasup.LogUpdateProcessor.finish [collection1] webapp=null path=null params={} {add=[100022]} 0 0
[junit4] 2> 39984 T288 C43 oasup.LogUpdateProcessor.finish [collection1] webapp=null path=null params={} {add=[100023]} 0 1
[junit4] 2> 39986 T288 C43 oasup.LogUpdateProcessor.finish [collection1] webapp=null path=null params={} {add=[100024]} 0 1
[junit4] 2> 39988 T288 C43 oasup.LogUpdateProcessor.finish [collection1] webapp=null path=null params={} {add=[100025]} 0 1
[junit4] 2> 39990 T288 C43 oasup.LogUpdateProcessor.finish [collection1] webapp=null path=null params={} {add=[100026]} 0 1
[junit4] 2> 39991 T288 C43 oasup.LogUpdateProcessor.finish [collection1] webapp=null path=null params={} {add=[100027]} 0 0
[junit4] 2> 39993 T288 C43 oasup.LogUpdateProcessor.finish [collection1] webapp=null path=null params={} {add=[100028]} 0 1
[junit4] 2> 39995 T288 C43 oasup.LogUpdateProcessor.finish [collection1] webapp=null path=null params={} {add=[100029]} 0 1
[junit4] 2> 39997 T288 C43 oasup.LogUpdateProcessor.finish [collection1] webapp=null path=null params={} {add=[100030]} 0 1
[junit4] 2> 39998 T288 C43 oasup.LogUpdateProcessor.finish [collection1] webapp=null path=null params={} {add=[100031]} 0 0
[junit4] 2> 40000 T288 C43 oasup.LogUpdateProcessor.finish [collection1] webapp=null path=null params={} {add=[100032]} 0 1
[junit4] 2> 40002 T288 C43 oasup.LogUpdateProcessor.finish [collection1] webapp=null path=null params={} {add=[100033]} 0 1
[junit4] 2> 40004 T288 C43 oasup.LogUpdateProcessor.finish [collection1] webapp=null path=null params={} {add=[100034]} 0 1
[junit4] 2> 40005 T288 C43 oasup.LogUpdateProcessor.finish [collection1] webapp=null path=null params={} {add=[100035]} 0 0
[junit4] 2> 40007 T288 C43 oasup.LogUpdateProcessor.finish [collection1] webapp=null path=null params={} {add=[100036]} 0 1
[junit4] 2> 40009 T288 C43 oasup.LogUpdateProcessor.finish [collection1] webapp=null path=null params={} {add=[100037]} 0 1
[junit4] 2> 40011 T288 C43 oasup.LogUpdateProcessor.finish [collection1] webapp=null path=null params={} {add=[100038]} 0 1
[junit4] 2> 40013 T288 C43 oasup.LogUpdateProcessor.finish [collection1] webapp=null path=null params={} {add=[100039]} 0 1
[junit4] 2> 40016 T288 C43 oasup.LogUpdateProcessor.finish [collection1] webapp=null path=null params={} {add=[100040]} 0 2
[junit4] 2> 40018 T288 C43 oasup.LogUpdateProcessor.finish [collection1] webapp=null path=null params={} {add=[100041]} 0 1
[junit4] 2> 40020 T288 C43 oasup.LogUpdateProcessor.finish [collection1] webapp=null path=null params={} {add=[100042]} 0 1
[junit4] 2> 40022 T288 C43 oasup.LogUpdateProcessor.finish [collection1] webapp=null path=null params={} {add=[100043]} 0 1
[junit4] 2> 40024 T288 C43 oasup.LogUpdateProcessor.finish [collection1] webapp=null path=null params={} {add=[100044]} 0 1
[junit4] 2> 40026 T288 C43 oasup.LogUpdateProcessor.finish [collection1] webapp=null path=null params={} {add=[100045]} 0 1
[junit4] 2> 40027 T288 C43 oasup.LogUpdateProcessor.finish [collection1] webapp=null path=null params={} {add=[100046]} 0 0
[junit4] 2> 40029 T288 C43 oasup.LogUpdateProcessor.finish [collection1] webapp=null path=null params={} {add=[100047]} 0 1
[junit4] 2> 40031 T288 C43 oasup.LogUpdateProcessor.finish [collection1] webapp=null path=null params={} {add=[100048]} 0 1
[junit4] 2> 40032 T288 C43 oasup.LogUpdateProcessor.finish [collection1] webapp=null path=null params={} {add=[100049]} 0 0
[junit4] 2> 40034 T288 C43 oasup.LogUpdateProcessor.finish [collection1] webapp=null path=null params={} {add=[100050]} 0 1
[junit4] 2> 40036 T288 C43 oasup.LogUpdateProcessor.finish [collection1] webapp=null path=null params={} {add=[100051]} 0 1
[junit4] 2> 40037 T288 C43 oasup.LogUpdateProcessor.finish [collection1] webapp=null path=null params={} {add=[100052]} 0 0
[junit4] 2> 40039 T288 C43 oasup.LogUpdateProcessor.finish [collection1] webapp=null path=null params={} {add=[100053]} 0 1
[junit4] 2> 40041 T288 C43 oasup.LogUpdateProcessor.finish [collection1] webapp=null path=null params={} {add=[100054]} 0 1
[junit4] 2> 40042 T288 C43 oasup.LogUpdateProcessor.finish [collection1] webapp=null path=null params={} {add=[100055]} 0 1
[junit4] 2> 40044 T288 C43 oasup.LogUpdateProcessor.finish [collection1] webapp=null path=null params={} {add=[100056]} 0 1
[junit4] 2> 40045 T288 C43 oasup.LogUpdateProcessor.finish [collection1] webapp=null path=null params={} {add=[100057]} 0 0
[junit4] 2> 40047 T288 C43 oasup.LogUpdateProcessor.finish [collection1] webapp=null path=null params={} {add=[100058]} 0 1
[junit4] 2> 40049 T288 C43 oasup.LogUpdateProcessor.finish [collection1] webapp=null path=null params={} {add=[100059]} 0 1
[junit4] 2> 40050 T288 C43 oasup.LogUpdateProcessor.finish [collection1] webapp=null path=null params={} {add=[100060]} 0 1
[junit4] 2> 40052 T288 C43 oasup.LogUpdateProcessor.finish [collection1] webapp=null path=null params={} {add=[100061]} 0 1
[junit4] 2> 40053 T288 C43 oasup.LogUpdateProcessor.finish [collection1] webapp=null path=null params={} {add=[100062]} 0 1
[junit4] 2> 40055 T288 C43 oasup.LogUpdateProcessor.finish [collection1] webapp=null path=null params={} {add=[100063]} 0 1
[junit4] 2> 40056 T288 C43 oasup.LogUpdateProcessor.finish [collection1] webapp=null path=null params={} {add=[100064]} 0 0
[junit4] 2> 40058 T288 C43 oasup.LogUpdateProcessor.finish [collection1] webapp=null path=null params={} {add=[100065]} 0 1
[junit4] 2> 40059 T288 C43 oasup.LogUpdateProcessor.finish [collection1] webapp=null path=null params={} {add=[100066]} 0 0
[junit4] 2> 40061 T288 C43 oasup.LogUpdateProcessor.finish [collection1] webapp=null path=null params={} {add=[100067]} 0 1
[junit4] 2> 40063 T288 C43 oasup.LogUpdateProcessor.finish [collection1] webapp=null path=null params={} {add=[100068]} 0 1
[junit4] 2> 40064 T288 C43 oasup.LogUpdateProcessor.finish [collection1] webapp=null path=null params={} {add=[100069]} 0 0
[junit4] 2> 40066 T288 C43 oasup.LogUpdateProcessor.finish [collection1] webapp=null path=null params={} {add=[100070]} 0 1
[junit4] 2> 40068 T288 C43 oasup.LogUpdateProcessor.finish [collection1] webapp=null path=null params={} {add=[100071]} 0 1
[junit4] 2> 40070 T288 C43 oasup.LogUpdateProcessor.finish [collection1] webapp=null path=null params={} {add=[100072]} 0 1
[junit4] 2> 40072 T288 C43 oasup.LogUpdateProcessor.finish [collection1] webapp=null path=null params={} {add=[100073]} 0 1
[junit4] 2> 40073 T288 C43 oasup.LogUpdateProcessor.finish [collection1] webapp=null path=null params={} {add=[100074]} 0 0
[junit4] 2> 40075 T288 C43 oasup.LogUpdateProcessor.finish [collection1] webapp=null path=null params={} {add=[100075]} 0 1
[junit4] 2> 40077 T288 C43 oasup.LogUpdateProcessor.finish [collection1] webapp=null path=null params={} {add=[100076]} 0 1
[junit4] 2> 40079 T288 C43 oasup.LogUpdateProcessor.finish [collection1] webapp=null path=null params={} {add=[100077]} 0 1
[junit4] 2> 40080 T288 C43 oasup.LogUpdateProcessor.finish [collection1] webapp=null path=null params={} {add=[100078]} 0 1
[junit4] 2> 40082 T288 C43 oasup.LogUpdateProcessor.finish [collection1] webapp=null path=null params={} {add=[100079]} 0 1
[junit4] 2> 40084 T288 C43 oasup.LogUpdateProcessor.finish [collection1] webapp=null path=null params={} {add=[100080]} 0 1
[junit4] 2> 40085 T288 C43 oasup.LogUpdateProcessor.finish [collection1] webapp=null path=null params={} {add=[100081]} 0 0
[junit4] 2> 40087 T288 C43 oasup.LogUpdateProcessor.finish [collection1] webapp=null path=null params={} {add=[100082]} 0 1
[junit4] 2> 40089 T288 C43 oasup.LogUpdateProcessor.finish [collection1] webapp=null path=null params={} {add=[100083]} 0 1
[junit4] 2> 40091 T288 C43 oasup.LogUpdateProcessor.finish [collection1] webapp=null path=null params={} {add=[100084]} 0 1
[junit4] 2> 40092 T288 C43 oasup.LogUpdateProcessor.finish [collection1] webapp=null path=null params={} {add=[100085]} 0 0
[junit4] 2> 40094 T288 C43 oasup.LogUpdateProcessor.finish [collection1] webapp=null path=null params={} {add=[100086]} 0 1
[junit4] 2> 40096 T288 C43 oasup.LogUpdateProcessor.finish [collection1] webapp=null path=null params={} {add=[100087]} 0 1
[junit4] 2> 40098 T288 C43 oasup.LogUpdateProcessor.finish [collection1] webapp=null path=null params={} {add=[100088]} 0 1
[junit4] 2> 40100 T288 C43 oasup.LogUpdateProcessor.finish [collection1] webapp=null path=null params={} {add=[100089]} 0 1
[junit4] 2> 40102 T288 C43 oasup.LogUpdateProcessor.finish [collection1] webapp=null path=null params={} {add=[100090]} 0 1
[junit4] 2> 40104 T288 C43 oasup.LogUpdateProcessor.finish [collection1] webapp=null path=null params={} {add=[100091]} 0 1
[junit4] 2> 40106 T288 C43 oasup.LogUpdateProcessor.finish [collection1] webapp=null path=null params={} {add=[100092]} 0 1
[junit4] 2> 40108 T288 C43 oasup.LogUpdateProcessor.finish [collection1] webapp=null path=null params={} {add=[100093]} 0 0
[junit4] 2> 40109 T288 C43 oasup.LogUpdateProcessor.finish [collection1] webapp=null path=null params={} {add=[100094]} 0 0
[junit4] 2> 40111 T288 C43 oasup.LogUpdateProcessor.finish [collection1] webapp=null path=null params={} {add=[100095]} 0 1
[junit4] 2> 40113 T288 C43 oasup.LogUpdateProcessor.finish [collection1] webapp=null path=null params={} {add=[100096]} 0 1
[junit4] 2> 40114 T288 C43 oasup.LogUpdateProcessor.finish [collection1] webapp=null path=null params={} {add=[100097]} 0 0
[junit4] 2> 40116 T288 C43 oasup.LogUpdateProcessor.finish [collection1] webapp=null path=null params={} {add=[100098]} 0 1
[junit4] 2> 40117 T288 C43 oasup.LogUpdateProcessor.finish [collection1] webapp=null path=null params={} {add=[100099]} 0 0
[junit4] 2> 40119 T288 C43 oasu.DirectUpdateHandler2.commit start commit{,optimize=false,openSearcher=true,waitSearcher=true,expungeDeletes=false,softCommit=false,prepareCommit=false}
[junit4] 2> 40137 T288 C43 oasc.SolrDeletionPolicy.onCommit SolrDeletionPolicy.onCommit: commits: num=2
[junit4] 2> commit{dir=MockDirectoryWrapper(org.apache.lucene.store.RAMDirectory@2229ce0c lockFactory=org.apache.lucene.store.SingleInstanceLockFactory@7044189b),segFN=segments_1,generation=1}
[junit4] 2> commit{dir=MockDirectoryWrapper(org.apache.lucene.store.RAMDirectory@2229ce0c lockFactory=org.apache.lucene.store.SingleInstanceLockFactory@7044189b),segFN=segments_2,generation=2}
[junit4] 2> 40137 T288 C43 oasc.SolrDeletionPolicy.updateCommits newest commit generation = 2
[junit4] 2> 40139 T288 C43 oass.SolrIndexSearcher.<init> Opening Searcher@ef81d35 main
[junit4] 2> 40140 T288 C43 oasu.DirectUpdateHandler2.commit end_commit_flush
[junit4] 2> 40140 T290 oasc.SolrCore.registerSearcher [collection1] Registered new searcher Searcher@ef81d35 main{StandardDirectoryReader(segments_2:4:nrt _0(5.0):C100)}
[junit4] 2> 40140 T288 C43 oasup.LogUpdateProcessor.finish [collection1] webapp=null path=null params={} {commit=} 0 22
[junit4] 2> 40266 T288 C43 oasc.SolrCore.execute [collection1] webapp=null path=null params={o.avr.s.s=abs(neg(sum(int_id)))&o.dr.s.mean=mean(int_id)&o.avr.s.c=abs(neg(count(long_ld)))&o.cr.s.csmin=const_str(this+is+the+first)&o.cr.s.min=min(string_sd)&indent=true&o.avr.s.sum=sum(int_id)&o.cdr.s.cs2=const_str(1804-06-30T23:59:59Z)&o.cdr.s.cd2=const_date(1804-06-30T23:59:59Z)&o.mr.s.mean=mean(int_id)&o.nr.s.count=count(long_ld)&o.csr.s.cs1=const_str(this+is+the+first)&o.ar.s.sum=sum(int_id)&o.cr.s.csmax=const_str(this+is+the+second)&o.nr.s.sum=sum(int_id)&o.ar.s.mean=mean(int_id)&o.dr.s.mc=div(mean(int_id),count(long_ld))&o.avr.s.count=count(long_ld)&o.dmr.s.cme=const_str(%2B2YEARS)&olap=true&o.pr.s.sum=sum(int_id)&o.csr.s.cs2=const_str(this+is+the+second)&o.nr.s.s=neg(sum(int_id))&o.cdr.s.cd1=const_date(1800-12-31T23:59:59Z)&stats=true&o.ar.s.unique=unique(long_ld)&o.pr.s.count=count(long_ld)&o.dr.s.sum=sum(int_id)&o.ar.s.median=median(int_id)&o.dmr.s.cma=const_str(%2B2MONTHS)&o.ar.s.mcm=add(mean(int_id),count(long_ld),median(int_id))&q=*:*&o.cnr.s.c8=const_num(8)&o.dr.s.su=div(sum(int_id),unique(long_ld))&o.ar.s.su=add(sum(int_id),unique(long_ld))&o.dmr.s.dmme=date_math(median(date_dtd),const_str(%2B2YEARS))&o.rr.s.min=min(string_sd)&o.mr.s.sum=sum(int_id)&o.cnr.s.c10=const_num(10)&o.pr.s.su=pow(sum(int_id),unique(long_ld))&o.cr.s.ccmin=concat(const_str(this+is+the+first),min(string_sd))&o.dr.s.count=count(long_ld)&o.ar.s.count=count(long_ld)&o.cdr.s.cs1=const_str(1800-12-31T23:59:59Z)&o.rr.s.rmin=rev(min(string_sd))&o.mr.s.su=mult(sum(int_id),unique(long_ld))&o.cr.s.max=max(string_sd)&o.mr.s.median=median(int_id)&o.mr.s.count=count(long_ld)&o.pr.s.mc=pow(mean(int_id),count(long_ld))&o.dmr.s.max=max(date_dtd)&o.cr.s.ccmax=concat(const_str(this+is+the+second),max(string_sd))&o.rr.s.max=max(string_sd)&o.mr.s.mcm=mult(mean(int_id),count(long_ld),median(int_id))&rows=0&o.mr.s.unique=unique(long_ld)&o.nr.s.c=neg(count(long_ld))&o.pr.s.mean=mean(int_id)&o.dr.s.unique=unique(long_ld)&o.dmr.s.median=median(date_dtd)&o.rr.s.rmax=rev(max(string_sd))&o.pr.s.unique=unique(long_ld)&o.csr.s.cs3=const_str(this+is+the+third)&o.dmr.s.dmma=date_math(max(date_dtd),const_str(%2B2MONTHS))} hits=100 status=0 QTime=120
[junit4] 2> 40279 T288 oas.SolrTestCaseJ4.setUp ###Starting constantNumberTest
[junit4] 2> 40284 T288 oas.SolrTestCaseJ4.tearDown ###Ending constantNumberTest
[junit4] 2> 40291 T288 oas.SolrTestCaseJ4.setUp ###Starting reverseTest
[junit4] 2> 40293 T288 oas.SolrTestCaseJ4.tearDown ###Ending reverseTest
[junit4] 2> 40301 T288 oas.SolrTestCaseJ4.setUp ###Starting negateTest
[junit4] 2> 40302 T288 oas.SolrTestCaseJ4.tearDown ###Ending negateTest
[junit4] 2> NOTE: reproduce with: ant test -Dtestcase=ExpressionTest -Dtests.method=negateTest -Dtests.seed=646717EF9CB6285C -Dtests.multiplier=3 -Dtests.slow=true -Dtests.locale=fi -Dtests.timezone=Asia/Makassar -Dtests.file.encoding=US-ASCII
[junit4] FAILURE 0.05s J0 | Expression
[...truncated too long message...]
e/Lucene-Solr-trunk-Linux/solr/build/solr-core/test/J1/./org.apache.solr.cloud.CollectionsAPIDistributedZkTest-jetty4-1390079640877/halfdeletedcollection2_shard3_replica2/data/index [CachedDir<<refCount=0;path=../../../../../../../../../../mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build/solr-core/test/J1/./org.apache.solr.cloud.CollectionsAPIDistributedZkTest-jetty4-1390079640877/halfdeletedcollection2_shard3_replica2/data/index;done=false>>]
[junit4] 2> 159611 T317 oasc.CachingDirectoryFactory.close Closing directory: ../../../../../../../../../../mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build/solr-core/test/J1/./org.apache.solr.cloud.CollectionsAPIDistributedZkTest-jetty4-1390079640877/halfdeletedcollection2_shard3_replica2/data/index
[junit4] 2> 159611 T317 oasc.CachingDirectoryFactory.closeCacheValue looking to close ../../../../../../../../../../mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build/solr-core/test/J1/./org.apache.solr.cloud.CollectionsAPIDistributedZkTest-jetty4-1390079640877/halfdeletedcollection2_shard3_replica2/data [CachedDir<<refCount=0;path=../../../../../../../../../../mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build/solr-core/test/J1/./org.apache.solr.cloud.CollectionsAPIDistributedZkTest-jetty4-1390079640877/halfdeletedcollection2_shard3_replica2/data;done=false>>]
[junit4] 2> 159611 T317 oasc.CachingDirectoryFactory.close Closing directory: ../../../../../../../../../../mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build/solr-core/test/J1/./org.apache.solr.cloud.CollectionsAPIDistributedZkTest-jetty4-1390079640877/halfdeletedcollection2_shard3_replica2/data
[junit4] 2> 159611 T317 oasc.CachingDirectoryFactory.close Removing directory after core close: ../../../../../../../../../../mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build/solr-core/test/J1/./org.apache.solr.cloud.CollectionsAPIDistributedZkTest-jetty4-1390079640877/halfdeletedcollection2_shard3_replica2/data
[junit4] 2> 159615 T317 oascc.SolrZkClient.makePath makePath: /collections/halfdeletedcollection2/leaders/shard3
[junit4] 2> 159615 T317 oasc.SolrException.log ERROR There was a problem trying to register as the leader:org.apache.zookeeper.KeeperException$SessionExpiredException: KeeperErrorCode = Session expired for /collections
[junit4] 2> at org.apache.zookeeper.KeeperException.create(KeeperException.java:127)
[junit4] 2> at org.apache.zookeeper.KeeperException.create(KeeperException.java:51)
[junit4] 2> at org.apache.zookeeper.ZooKeeper.exists(ZooKeeper.java:1041)
[junit4] 2> at org.apache.solr.common.cloud.SolrZkClient$3.execute(SolrZkClient.java:205)
[junit4] 2> at org.apache.solr.common.cloud.SolrZkClient$3.execute(SolrZkClient.java:202)
[junit4] 2> at org.apache.solr.common.cloud.ZkCmdExecutor.retryOperation(ZkCmdExecutor.java:73)
[junit4] 2> at org.apache.solr.common.cloud.SolrZkClient.exists(SolrZkClient.java:202)
[junit4] 2> at org.apache.solr.common.cloud.SolrZkClient.makePath(SolrZkClient.java:413)
[junit4] 2> at org.apache.solr.common.cloud.SolrZkClient.makePath(SolrZkClient.java:382)
[junit4] 2> at org.apache.solr.common.cloud.SolrZkClient.makePath(SolrZkClient.java:369)
[junit4] 2> at org.apache.solr.cloud.ShardLeaderElectionContextBase.runLeaderProcess(ElectionContext.java:112)
[junit4] 2> at org.apache.solr.cloud.ShardLeaderElectionContext.runLeaderProcess(ElectionContext.java:273)
[junit4] 2> at org.apache.solr.cloud.LeaderElector.runIamLeaderProcess(LeaderElector.java:164)
[junit4] 2> at org.apache.solr.cloud.LeaderElector.checkIfIamLeader(LeaderElector.java:108)
[junit4] 2> at org.apache.solr.cloud.LeaderElector.access$000(LeaderElector.java:55)
[junit4] 2> at org.apache.solr.cloud.LeaderElector$1.process(LeaderElector.java:137)
[junit4] 2> at org.apache.zookeeper.ClientCnxn$EventThread.processEvent(ClientCnxn.java:519)
[junit4] 2> at org.apache.zookeeper.ClientCnxn$EventThread.run(ClientCnxn.java:495)
[junit4] 2>
[junit4] 2> 159616 T317 oasc.LeaderElector$1.process WARN org.apache.zookeeper.KeeperException$SessionExpiredException: KeeperErrorCode = Session expired for /collections/halfdeletedcollection2/leader_elect/shard3/election/91100259055632398-core_node6-n_0000000001
[junit4] 2> at org.apache.zookeeper.KeeperException.create(KeeperException.java:127)
[junit4] 2> at org.apache.zookeeper.KeeperException.create(KeeperException.java:51)
[junit4] 2> at org.apache.zookeeper.ZooKeeper.delete(ZooKeeper.java:873)
[junit4] 2> at org.apache.solr.common.cloud.SolrZkClient$2.execute(SolrZkClient.java:173)
[junit4] 2> at org.apache.solr.common.cloud.SolrZkClient$2.execute(SolrZkClient.java:170)
[junit4] 2> at org.apache.solr.common.cloud.ZkCmdExecutor.retryOperation(ZkCmdExecutor.java:73)
[junit4] 2> at org.apache.solr.common.cloud.SolrZkClient.delete(SolrZkClient.java:170)
[junit4] 2> at org.apache.solr.cloud.ElectionContext.cancelElection(ElectionContext.java:67)
[junit4] 2> at org.apache.solr.cloud.ShardLeaderElectionContext.runLeaderProcess(ElectionContext.java:293)
[junit4] 2> at org.apache.solr.cloud.LeaderElector.runIamLeaderProcess(LeaderElector.java:164)
[junit4] 2> at org.apache.solr.cloud.LeaderElector.checkIfIamLeader(LeaderElector.java:108)
[junit4] 2> at org.apache.solr.cloud.LeaderElector.access$000(LeaderElector.java:55)
[junit4] 2> at org.apache.solr.cloud.LeaderElector$1.process(LeaderElector.java:137)
[junit4] 2> at org.apache.zookeeper.ClientCnxn$EventThread.processEvent(ClientCnxn.java:519)
[junit4] 2> at org.apache.zookeeper.ClientCnxn$EventThread.run(ClientCnxn.java:495)
[junit4] 2>
[junit4] 2> 159616 T317 oascc.ZkStateReader$3.process WARN ZooKeeper watch triggered, but Solr cannot talk to ZK
[junit4] 2> 159616 T317 oascc.ZkStateReader$2.process A cluster state change: WatchedEvent state:SyncConnected type:NodeDataChanged path:/clusterstate.json, has occurred - updating... (live nodes size: 5)
[junit4] 2> 159616 T317 oascc.ZkStateReader$2.process WARN ZooKeeper watch triggered, but Solr cannot talk to ZK
[junit4] 2> 159617 T317 oasc.LeaderElector$1.process WARN org.apache.zookeeper.KeeperException$SessionExpiredException: KeeperErrorCode = Session expired for /overseer_elect/election
[junit4] 2> at org.apache.zookeeper.KeeperException.create(KeeperException.java:127)
[junit4] 2> at org.apache.zookeeper.KeeperException.create(KeeperException.java:51)
[junit4] 2> at org.apache.zookeeper.ZooKeeper.getChildren(ZooKeeper.java:1468)
[junit4] 2> at org.apache.solr.common.cloud.SolrZkClient$6.execute(SolrZkClient.java:256)
[junit4] 2> at org.apache.solr.common.cloud.SolrZkClient$6.execute(SolrZkClient.java:253)
[junit4] 2> at org.apache.solr.common.cloud.ZkCmdExecutor.retryOperation(ZkCmdExecutor.java:73)
[junit4] 2> at org.apache.solr.common.cloud.SolrZkClient.getChildren(SolrZkClient.java:253)
[junit4] 2> at org.apache.solr.cloud.LeaderElector.checkIfIamLeader(LeaderElector.java:92)
[junit4] 2> at org.apache.solr.cloud.LeaderElector.access$000(LeaderElector.java:55)
[junit4] 2> at org.apache.solr.cloud.LeaderElector$1.process(LeaderElector.java:137)
[junit4] 2> at org.apache.zookeeper.ClientCnxn$EventThread.processEvent(ClientCnxn.java:519)
[junit4] 2> at org.apache.zookeeper.ClientCnxn$EventThread.run(ClientCnxn.java:495)
[junit4] 2>
[junit4] 2> NOTE: test params are: codec=Lucene40, sim=RandomSimilarityProvider(queryNorm=true,coord=no): {}, locale=th, timezone=Navajo
[junit4] 2> NOTE: Linux 3.8.0-35-generic amd64/Oracle Corporation 1.7.0_60-ea (64-bit)/cpus=8,threads=5,free=90335168,total=360710144
[junit4] 2> NOTE: All tests run in this JVM: [ConvertedLegacyTest, PreAnalyzedFieldTest, BlockDirectoryTest, SpellCheckComponentTest, TestStressLucene, TestSweetSpotSimilarityFactory, TestFreeTextSuggestions, TestSchemaVersionResource, TestPhraseSuggestions, SolrTestCaseJ4Test, TestFuzzyAnalyzedSuggestions, SignatureUpdateProcessorFactoryTest, TestUtils, TestFoldingMultitermQuery, TestImplicitCoreProperties, TestRecovery, TestSchemaNameResource, NumericFieldsTest, PrimUtilsTest, CurrencyFieldOpenExchangeTest, DisMaxRequestHandlerTest, QueryFacetTest, SpellCheckCollatorTest, TestCodecSupport, CollectionsAPIDistributedZkTest]
[junit4] Completed on J1 in 99.87s, 1 test, 1 failure <<< FAILURES!
[...truncated 885 lines...]
BUILD FAILED
/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/build.xml:453: The following error occurred while executing this line:
/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/build.xml:433: The following error occurred while executing this line:
/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/build.xml:39: The following error occurred while executing this line:
/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/extra-targets.xml:37: The following error occurred while executing this line:
/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/build.xml:189: The following error occurred while executing this line:
/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/solr/common-build.xml:491: The following error occurred while executing this line:
/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/lucene/common-build.xml:1304: The following error occurred while executing this line:
/mnt/ssd/jenkins/workspace/Lucene-Solr-trunk-Linux/lucene/common-build.xml:937: There were test failures: 364 suites, 1595 tests, 7 failures, 34 ignored (6 assumptions)
Total time: 40 minutes 1 second
Build step 'Invoke Ant' marked build as failure
Description set: Java: 64bit/jdk1.7.0_60-ea-b02 -XX:-UseCompressedOops -XX:+UseParallelGC
Archiving artifacts
Recording test results
Email was triggered for: Failure
Sending email for trigger: Failure