See <https://qa.nuxeo.org/jenkins/job/IT-nuxeo-5.4-tests-dm-jboss-oracle11/113/>

------------------------------------------
[...truncated 1002 lines...]
06:25:12.607 INFO - Checking Resource aliases
06:25:17.177 INFO - Checking Resource aliases
06:25:17.181 INFO - Received posted results
06:25:17.427 INFO - Killing Firefox...
Tests failed, see result file for details: 
<https://qa.nuxeo.org/jenkins/job/IT-nuxeo-5.4-tests-dm-jboss-oracle11/113/artifact/trunk/nuxeo-distribution-5.4/nuxeo-distribution-dm/ftest/selenium/result-suite-dm.html>
06:25:17.501 INFO - Shutting down...
06:25:17.502 INFO - Stopping Acceptor 
ServerSocket[addr=0.0.0.0/0.0.0.0,port=0,localport=14440]
+ [ 1 != 0 ]
+ echo ### [ERROR] suite-dm TEST FAILURE
### [ERROR] suite-dm TEST FAILURE
+ exit_code=9
+ sleep 5
+ echo ### [INFO] Running test suite suite-webengine ...
### [INFO] Running test suite suite-webengine ...
+ java -jar selenium-server.jar -port 14440 -timeout 7200 -browserSideLog 
-htmlSuite *chrome http://localhost:8080/nuxeo/ 
<https://qa.nuxeo.org/jenkins/job/IT-nuxeo-5.4-tests-dm-jboss-oracle11/ws/trunk/nuxeo-distribution-5.4/nuxeo-distribution-dm/ftest/selenium/tests/suite-webengine.html>
 
<https://qa.nuxeo.org/jenkins/job/IT-nuxeo-5.4-tests-dm-jboss-oracle11/113/artifact/trunk/nuxeo-distribution-5.4/nuxeo-distribution-dm/ftest/selenium/result-suite-webengine.html>
 -firefoxProfileTemplate ffprofile -userExtensions user-extensions.js
06:25:22.936 INFO - Java: Sun Microsystems Inc. 19.1-b02
06:25:22.937 INFO - OS: Linux 2.6.32-28-generic-pae i386
06:25:22.942 INFO - v2.0 [b1], with Core v2.0 [b1]
06:25:23.044 INFO - RemoteWebDriver instances should connect to: 
http://127.0.0.1:14440/wd/hub
06:25:23.045 INFO - Version Jetty/5.1.x
06:25:23.046 INFO - Started 
HttpContext[/selenium-server/driver,/selenium-server/driver]
06:25:23.046 INFO - Started HttpContext[/selenium-server,/selenium-server]
06:25:23.047 INFO - Started HttpContext[/,/]
06:25:40.073 INFO - Started 
org.openqa.jetty.jetty.servlet.ServletHandler@1d64c37
06:25:40.073 INFO - Started HttpContext[/wd,/wd]
06:25:40.081 INFO - Started SocketListener on 0.0.0.0:14440
06:25:40.081 INFO - Started org.openqa.jetty.jetty.Server@116ab4e
06:25:40.166 INFO - Preparing Firefox profile...
06:25:42.446 INFO - Launching Firefox...
06:25:43.063 INFO - Checking Resource aliases
06:25:49.298 INFO - Checking Resource aliases
06:25:49.299 INFO - Received posted results
06:25:49.951 INFO - Killing Firefox...
06:25:50.015 INFO - Shutting down...
06:25:50.016 INFO - Stopping Acceptor 
ServerSocket[addr=0.0.0.0/0.0.0.0,port=0,localport=14440]
+ [ 0 != 0 ]
+ echo ### [INFO] suite-webengine TEST SUCCESSFUL
### [INFO] suite-webengine TEST SUCCESSFUL
+ sleep 5
+ echo ### [INFO] Running test suite suite-webengine-website ...
### [INFO] Running test suite suite-webengine-website ...
+ java -jar selenium-server.jar -port 14440 -timeout 7200 -browserSideLog 
-htmlSuite *chrome http://localhost:8080/nuxeo/ 
<https://qa.nuxeo.org/jenkins/job/IT-nuxeo-5.4-tests-dm-jboss-oracle11/ws/trunk/nuxeo-distribution-5.4/nuxeo-distribution-dm/ftest/selenium/tests/suite-webengine-website.html>
 
<https://qa.nuxeo.org/jenkins/job/IT-nuxeo-5.4-tests-dm-jboss-oracle11/113/artifact/trunk/nuxeo-distribution-5.4/nuxeo-distribution-dm/ftest/selenium/result-suite-webengine-website.html>
 -firefoxProfileTemplate ffprofile -userExtensions user-extensions.js
06:25:55.506 INFO - Java: Sun Microsystems Inc. 19.1-b02
06:25:55.507 INFO - OS: Linux 2.6.32-28-generic-pae i386
06:25:55.512 INFO - v2.0 [b1], with Core v2.0 [b1]
06:25:55.614 INFO - RemoteWebDriver instances should connect to: 
http://127.0.0.1:14440/wd/hub
06:25:55.616 INFO - Version Jetty/5.1.x
06:25:55.616 INFO - Started 
HttpContext[/selenium-server/driver,/selenium-server/driver]
06:25:55.617 INFO - Started HttpContext[/selenium-server,/selenium-server]
06:25:55.617 INFO - Started HttpContext[/,/]
06:26:18.877 INFO - Started org.openqa.jetty.jetty.servlet.ServletHandler@25d2b2
06:26:18.877 INFO - Started HttpContext[/wd,/wd]
06:26:18.885 INFO - Started SocketListener on 0.0.0.0:14440
06:26:18.885 INFO - Started org.openqa.jetty.jetty.Server@148aa23
06:26:18.988 INFO - Preparing Firefox profile...
06:26:21.266 INFO - Launching Firefox...
06:26:21.911 INFO - Checking Resource aliases
06:27:03.228 INFO - Checking Resource aliases
06:27:03.229 INFO - Received posted results
06:27:03.775 INFO - Killing Firefox...
06:27:03.891 INFO - Shutting down...
06:27:03.893 INFO - Stopping Acceptor 
ServerSocket[addr=0.0.0.0/0.0.0.0,port=0,localport=14440]
+ [ 0 != 0 ]
+ echo ### [INFO] suite-webengine-website TEST SUCCESSFUL
### [INFO] suite-webengine-website TEST SUCCESSFUL
+ sleep 5
+ echo ### [INFO] Running test suite suite-webengine-tags ...
### [INFO] Running test suite suite-webengine-tags ...
+ java -jar selenium-server.jar -port 14440 -timeout 7200 -browserSideLog 
-htmlSuite *chrome http://localhost:8080/nuxeo/ 
<https://qa.nuxeo.org/jenkins/job/IT-nuxeo-5.4-tests-dm-jboss-oracle11/ws/trunk/nuxeo-distribution-5.4/nuxeo-distribution-dm/ftest/selenium/tests/suite-webengine-tags.html>
 
<https://qa.nuxeo.org/jenkins/job/IT-nuxeo-5.4-tests-dm-jboss-oracle11/113/artifact/trunk/nuxeo-distribution-5.4/nuxeo-distribution-dm/ftest/selenium/result-suite-webengine-tags.html>
 -firefoxProfileTemplate ffprofile -userExtensions user-extensions.js
06:27:09.481 INFO - Java: Sun Microsystems Inc. 19.1-b02
06:27:09.483 INFO - OS: Linux 2.6.32-28-generic-pae i386
06:27:09.487 INFO - v2.0 [b1], with Core v2.0 [b1]
06:27:09.595 INFO - RemoteWebDriver instances should connect to: 
http://127.0.0.1:14440/wd/hub
06:27:09.596 INFO - Version Jetty/5.1.x
06:27:09.597 INFO - Started 
HttpContext[/selenium-server/driver,/selenium-server/driver]
06:27:09.597 INFO - Started HttpContext[/selenium-server,/selenium-server]
06:27:09.598 INFO - Started HttpContext[/,/]
06:27:09.612 INFO - Started org.openqa.jetty.jetty.servlet.ServletHandler@9e29fb
06:27:09.612 INFO - Started HttpContext[/wd,/wd]
06:27:09.615 INFO - Started SocketListener on 0.0.0.0:14440
06:27:09.615 INFO - Started org.openqa.jetty.jetty.Server@116ab4e
06:27:09.697 INFO - Preparing Firefox profile...
06:27:11.888 INFO - Launching Firefox...
06:27:12.540 INFO - Checking Resource aliases
06:27:29.022 INFO - Checking Resource aliases
06:27:29.023 INFO - Received posted results
06:27:29.404 INFO - Killing Firefox...
06:27:29.469 INFO - Shutting down...
06:27:29.470 INFO - Stopping Acceptor 
ServerSocket[addr=0.0.0.0/0.0.0.0,port=0,localport=14440]
+ [ 0 != 0 ]
+ echo ### [INFO] suite-webengine-tags TEST SUCCESSFUL
### [INFO] suite-webengine-tags TEST SUCCESSFUL
+ sleep 5
+ [ 9 != 0 ]
+ echo ### [ERROR] TESTS FAILURE
### [ERROR] TESTS FAILURE
+ exit 9
+ ret1=9
+ '[' -z ']'
+ grep 1.6.0
+ java -version
java version "1.6.0_24"
Java(TM) SE Runtime Environment (build 1.6.0_24-b07)
+ '[' 0 == 0 ']'
+ cd 
<https://qa.nuxeo.org/jenkins/job/IT-nuxeo-5.4-tests-dm-jboss-oracle11/ws/trunk/nuxeo-distribution-5.4/nuxeo-distribution-dm/ftest/funkload>
+ make EXT=--no-color
mkdir -p ../../target/ftest/funkload/report ../../target/ftest/funkload/log
fl-monitor-ctl monitor.conf restart
Starting monitor server at http://localhost:55502/ as daemon.
fl-credential-ctl credential.conf restart
Starting file_credential server at http://localhost:55501/ as daemon.
fl-run-test test_pages.py --simple-fetch -v -e testAvailable --no-color
testAvailable (test_pages.Pages) ... ok

----------------------------------------------------------------------
Ran 1 test in 0.029s

OK
fl-run-test -v --simple-fetch test_rest.py -e testWriter --no-color
testWriter (test_rest.Rest) ... ok

----------------------------------------------------------------------
Ran 1 test in 1.215s

OK
fl-run-test -v --simple-fetch test_rest.py -e testReader --no-color
testReader (test_rest.Rest) ... ok

----------------------------------------------------------------------
Ran 1 test in 0.976s

OK
fl-run-test -v --simple-fetch test_pages.py --no-color
testAvailable (test_pages.Pages) ... ok
testBasePageViewDocumentPath (test_pages.Pages) ... ok
testFileTabs (test_pages.Pages) ... ok
testFolderPage (test_pages.Pages) ... ok
testLoginPage (test_pages.Pages) ... ok
testNavigation (test_pages.Pages) ... ok
testPublish (test_pages.Pages) ... ok
testSections (test_pages.Pages) ... ok
testUsersGroupsPage (test_pages.Pages) ... ok

----------------------------------------------------------------------
Ran 9 tests in 24.712s

OK
fl-run-test -v --simple-fetch test_nuxeo.py -e testInit --no-color
testInit (test_nuxeo.Nuxeo) ... ok

----------------------------------------------------------------------
Ran 1 test in 11.958s

OK
fl-run-test -v --simple-fetch test_nuxeo.py -e testWriter --no-color
testWriter (test_nuxeo.Nuxeo) ... ok

----------------------------------------------------------------------
Ran 1 test in 14.834s

OK
fl-run-test -v --simple-fetch test_nuxeo.py -e testReader --no-color
testReader (test_nuxeo.Nuxeo) ... ok

----------------------------------------------------------------------
Ran 1 test in 3.024s

OK
fl-run-test -v --simple-fetch test_webengine.py --no-color
test_testWebengine (test_webengine.Webengine) ... ok

----------------------------------------------------------------------
Ran 1 test in 2.316s

OK
fl-monitor-ctl monitor.conf stop
Server http://localhost:55502/ is stopped.
fl-credential-ctl credential.conf stop
Server http://localhost:55501/ is stopped.
+ ret2=0
+ ret3=0
+ stop_server
+ 
SERVER_HOME=<https://qa.nuxeo.org/jenkins/job/IT-nuxeo-5.4-tests-dm-jboss-oracle11/ws/trunk/jboss>
+ 
<https://qa.nuxeo.org/jenkins/job/IT-nuxeo-5.4-tests-dm-jboss-oracle11/ws/trunk/jboss/bin/monitorctl.sh>
 stop
<https://qa.nuxeo.org/jenkins/job/IT-nuxeo-5.4-tests-dm-jboss-oracle11/ws/trunk/jboss/bin/monitorctl.sh>:
 line 121: -server -Xms1g -Xmx1g -XX:MaxPermSize=512m 
-Dsun.rmi.dgc.client.gcInterval=3600000 -Dsun.rmi.dgc.server.gcInterval=3600000 
-Xloggc:${nuxeo.log.dir}/gc.log -verbose:gc -XX:+PrintGCDetails 
-XX:+PrintGCTimeStamps: bad substitution
Stopping monitoring 2011-05-17 06:28:37+02:00 ...
Monitoring stopped.
Archiving log ...
Done: 
<https://qa.nuxeo.org/jenkins/job/IT-nuxeo-5.4-tests-dm-jboss-oracle11/113/artifact/trunk/jboss/log/log-20110517-042841.tgz>
+ 
<https://qa.nuxeo.org/jenkins/job/IT-nuxeo-5.4-tests-dm-jboss-oracle11/ws/trunk/jboss/bin/nuxeoctl>
 stop
Launcher command: java -Dlauncher.java.opts=-server -Xms1g -Xmx1g 
-XX:MaxPermSize=512m -Dsun.rmi.dgc.client.gcInterval=3600000 
-Dsun.rmi.dgc.server.gcInterval=3600000 -Xloggc:${nuxeo.log.dir}/gc.log 
-verbose:gc -XX:+PrintGCDetails -XX:+PrintGCTimeStamps 
-Djava.net.preferIPv4Stack=true -Djava.awt.headless=true 
-Dnuxeo.home=<https://qa.nuxeo.org/jenkins/job/IT-nuxeo-5.4-tests-dm-jboss-oracle11/ws/trunk/jboss>
 
-Dnuxeo.conf=<https://qa.nuxeo.org/jenkins/job/IT-nuxeo-5.4-tests-dm-jboss-oracle11/ws/trunk/jboss/bin/nuxeo.conf>
 
-Dnuxeo.log.dir=<https://qa.nuxeo.org/jenkins/job/IT-nuxeo-5.4-tests-dm-jboss-oracle11/ws/trunk/jboss/log>
 -jar 
<https://qa.nuxeo.org/jenkins/job/IT-nuxeo-5.4-tests-dm-jboss-oracle11/ws/trunk/jboss/bin/nuxeo-launcher.jar>
 stop
Nuxeo home:          
<https://qa.nuxeo.org/jenkins/job/IT-nuxeo-5.4-tests-dm-jboss-oracle11/ws/trunk/jboss>
Nuxeo configuration: 
<https://qa.nuxeo.org/jenkins/job/IT-nuxeo-5.4-tests-dm-jboss-oracle11/ws/trunk/jboss/bin/nuxeo.conf>
May 17, 2011 6:28:42 AM org.artofsolving.jodconverter.util.PlatformUtils 
searchExistingfile
INFO: Jod will be using /usr/lib/openoffice
May 17, 2011 6:28:42 AM org.artofsolving.jodconverter.util.PlatformUtils 
searchExistingfile
INFO: Jod will be using /home/hudson/.openoffice.org/3
Include template: 
<https://qa.nuxeo.org/jenkins/job/IT-nuxeo-5.4-tests-dm-jboss-oracle11/ws/trunk/jboss/templates/common-deploydir>
Include template: 
<https://qa.nuxeo.org/jenkins/job/IT-nuxeo-5.4-tests-dm-jboss-oracle11/ws/trunk/jboss/templates/common-binding>
Include template: 
<https://qa.nuxeo.org/jenkins/job/IT-nuxeo-5.4-tests-dm-jboss-oracle11/ws/trunk/jboss/templates/common>
Include template: 
<https://qa.nuxeo.org/jenkins/job/IT-nuxeo-5.4-tests-dm-jboss-oracle11/ws/trunk/jboss/templates/oracle>
Include template: 
<https://qa.nuxeo.org/jenkins/job/IT-nuxeo-5.4-tests-dm-jboss-oracle11/ws/trunk/jboss/templates/monitor>
Stopping server..................No answer from server, try to kill process 
4648...
+ '[' '!' -z ']'
+ echo '### 10 most frequent errors --------------'
### 10 most frequent errors --------------
+ sort
+ grep ' ERROR \[' 
<https://qa.nuxeo.org/jenkins/job/IT-nuxeo-5.4-tests-dm-jboss-oracle11/113/artifact/trunk/jboss/log/server.log>
+ sort -nr
+ uniq -c
+ sed 's/^.\{24\}//g'
+ head
      9 ERROR [org.jboss.seam.jsf.SeamPhaseListener] swallowing exception
      8 ERROR [nuxeo-error-log] 
      6 ERROR [org.nuxeo.ecm.core.event.impl.ReconnectedEventBundleImpl] Can 
not refetch Doc with ref febc6193-ce55-4ce1-b319-b8bc1d3f4433
      6 ERROR [org.nuxeo.ecm.core.event.impl.ReconnectedEventBundleImpl] Can 
not refetch Doc with ref 9c564244-ef9a-4595-8505-355b30572409
      5 ERROR 
[org.apache.catalina.core.ContainerBase.[jboss.web].[localhost].[/nuxeo]] 
Session event listener threw exception
      3 ERROR 
[org.nuxeo.ecm.platform.web.common.exceptionhandling.DefaultNuxeoExceptionHandler]
 javax.el.ELException: org.nuxeo.ecm.core.api.DocumentSecurityException: 
Privilege 'Read' is not granted to 'jdoe'
      3 ERROR [nuxeo-error-log] javax.el.ELException: 
org.nuxeo.ecm.core.api.DocumentSecurityException: Privilege 'Read' is not 
granted to 'jdoe'
      2 ERROR [org.nuxeo.ecm.core.storage.sql.jdbc.JDBCMapper] XA end error on 
< 131075, 29, 27, 
4945551024848484948495899985050585210010049102524856584997549755102484848494849589998505058521001004910252485658499754100
 >
      1 ERROR [org.nuxeo.ecm.webapp.context.NavigationContextBean] 
<resetCurrentPath> documentManager not initialized
      1 ERROR 
[org.nuxeo.ecm.platform.web.common.exceptionhandling.service.DefaultRequestDumper]
 ERROR TRYING TO GET THIS REQUEST ATTRIBUTE VALUE: lockActions
+ echo '### 10 first errors ----------------------'
### 10 first errors ----------------------
+ grep -nTm 10 ' ERROR ' 
<https://qa.nuxeo.org/jenkins/job/IT-nuxeo-5.4-tests-dm-jboss-oracle11/113/artifact/trunk/jboss/log/server.log>
2067    :2011-05-17 06:12:16,139 ERROR 
[org.nuxeo.ecm.core.storage.sql.jdbc.JDBCLogger] (2) SQL: Resetting connection
2327    :2011-05-17 06:12:27,971 ERROR 
[org.nuxeo.ecm.core.storage.sql.jdbc.JDBCMapper] XA end error on < 131075, 29, 
27, 
4945551024848484948495899985050585210010049102524856584997549755102484848494849589998505058521001004910252485658499754100
 >
2439    :2011-05-17 06:12:27,980 ERROR 
[org.nuxeo.ecm.core.storage.sql.jdbc.JDBCMapper] XA end error on < 131075, 29, 
27, 
4945551024848484948495899985050585210010049102524856584997549755102484848494849589998505058521001004910252485658499754100
 >
2648    :2011-05-17 06:12:28,003 ERROR [org.jboss.seam.jsf.SeamPhaseListener] 
swallowing exception
2822    :2011-05-17 06:12:29,790 ERROR [org.jboss.seam.jsf.SeamPhaseListener] 
swallowing exception
2897    :2011-05-17 06:12:29,794 ERROR 
[org.nuxeo.ecm.platform.ui.web.rest.FancyNavigationHandler] error occured while 
appending params to request: 
3002    :2011-05-17 06:12:32,893 ERROR 
[org.nuxeo.ecm.webapp.context.NavigationContextBean] <resetCurrentPath> 
documentManager not initialized
3003    :2011-05-17 06:12:32,907 ERROR [facelets.viewhandler] Error Rendering 
View[/search/search_results_advanced.xhtml]
3160    :2011-05-17 06:12:32,909 ERROR 
[javax.enterprise.resource.webcontainer.jsf.lifecycle] 
jsf.lifecycle.phase.exception
3473    :2011-05-17 06:12:32,944 ERROR [org.ajax4jsf.webapp.BaseXMLFilter] 
Exception in the filter chain
+ echo '### --------------------------------------'
### --------------------------------------
+ gzip 
<https://qa.nuxeo.org/jenkins/job/IT-nuxeo-5.4-tests-dm-jboss-oracle11/113/artifact/trunk/jboss/log/boot.log>
 
<https://qa.nuxeo.org/jenkins/job/IT-nuxeo-5.4-tests-dm-jboss-oracle11/113/artifact/trunk/jboss/log/console.log>
 
<https://qa.nuxeo.org/jenkins/job/IT-nuxeo-5.4-tests-dm-jboss-oracle11/113/artifact/trunk/jboss/log/gc.log>
 
<https://qa.nuxeo.org/jenkins/job/IT-nuxeo-5.4-tests-dm-jboss-oracle11/113/artifact/trunk/jboss/log/jvm.log>
 
<https://qa.nuxeo.org/jenkins/job/IT-nuxeo-5.4-tests-dm-jboss-oracle11/113/artifact/trunk/jboss/log/nuxeo-ds.log>
 
<https://qa.nuxeo.org/jenkins/job/IT-nuxeo-5.4-tests-dm-jboss-oracle11/113/artifact/trunk/jboss/log/nuxeo-error.log>
 
<https://qa.nuxeo.org/jenkins/job/IT-nuxeo-5.4-tests-dm-jboss-oracle11/113/artifact/trunk/jboss/log/server.log>
 
<https://qa.nuxeo.org/jenkins/job/IT-nuxeo-5.4-tests-dm-jboss-oracle11/113/artifact/trunk/jboss/log/stderr.log>
 
<https://qa.nuxeo.org/jenkins/job/IT-nuxeo-5.4-tests-dm-jboss-oracle11/113/artifact/trun
 k/jboss/log/sysstat-sar.log> 
<https://qa.nuxeo.org/jenkins/job/IT-nuxeo-5.4-tests-dm-jboss-oracle11/113/artifact/trunk/jboss/log/vcs-ds.log>
 
<https://qa.nuxeo.org/jenkins/job/IT-nuxeo-5.4-tests-dm-jboss-oracle11/113/artifact/trunk/jboss/log/webrequests.log>
 
<https://qa.nuxeo.org/jenkins/job/IT-nuxeo-5.4-tests-dm-jboss-oracle11/113/artifact/trunk/jboss/log/webthreads.log>
+ gzip -cd 
<https://qa.nuxeo.org/jenkins/job/IT-nuxeo-5.4-tests-dm-jboss-oracle11/113/artifact/trunk/jboss/log/server.log.gz>
+ '[' 9 -eq 0 -a 0 -eq 0 ']'
+ exit 9
Archiving artifacts
Publishing Selenium report...
  Test failures: 32
  Test totals  : 108
------------------------
  Command Passes   : 987
  Command Failures : 34
  Command Errors   : 30

_______________________________________________
ECM-QA mailing list
[email protected]
http://lists.nuxeo.com/mailman/listinfo/ecm-qa

Reply via email to