Announcement

Collapse
No announcement yet.
X
  • Filter
  • Time
Clear All
new posts

    TestRunner issues

    Hi,
    we are testing TestRunner utility (SmartGwt Power 4.0).

    We correctly created the "batchRun" and "testResult" tables with AdminConsole utility.

    We ran the code found into TestRunner documentation as follows:

    TestRunnerDriver driver = new TestRunnerDriver();
    driver.setTestRoot(System.getProperty("user.install.root") + "\\" + "selenium_testRoot");
    driver.setBatchCommit(true);

    String[] files = {"test1.rctest.html"};
    driver.setFiles(files);

    driver.run();

    The "testRoot" is an external path. The "test1.rctest.html" file is into this path.

    The execution generates the following log:

    [18/07/13 10.04.18:441 CEST] 00000032 SystemOut O === 2013-07-18 10:04:18,441 [ : 5] DEBUG SQLDriver - Freeing SQLDriver dbConnection 100992517
    [18/07/13 10.04.18:441 CEST] 00000032 SystemOut O === 2013-07-18 10:04:18,441 [ : 5] DEBUG SQLConnectionManager - About to close PoolableConnection with hashcode "100992517"
    [18/07/13 10.04.21:100 CEST] 00000032 SeleniumServe I org.openqa.selenium.server.log.LoggingManager configureLogging Writing debug logs to selenium.log
    [18/07/13 10.04.21:104 CEST] 00000032 SeleniumServe I org.openqa.selenium.server.SeleniumServer logStartupInfo Java: IBM Corporation 2.4
    [18/07/13 10.04.21:105 CEST] 00000032 SeleniumServe I org.openqa.selenium.server.SeleniumServer logStartupInfo OS: Windows 7 6.1 build 7600 x86
    [18/07/13 10.04.21:135 CEST] 00000032 SeleniumServe I org.openqa.selenium.server.SeleniumServer logVersionNumber v2.26.0, with Core v2.26.0. Built from revision 18041
    [18/07/13 10.04.21:683 CEST] 00000032 SeleniumServe I org.openqa.selenium.server.SeleniumServer createWebDriverRemoteContext RemoteWebDriver instances should connect to: http://127.0.0.1:4444/wd/hub
    [18/07/13 10.04.21:693 CEST] 00000032 HttpServer I org.openqa.jetty.http.HttpServer doStart Version Jetty/5.1.x
    [18/07/13 10.04.21:697 CEST] 00000032 Container I org.openqa.jetty.util.Container start Started HttpContext[/selenium-server,/selenium-server]
    [18/07/13 10.04.21:712 CEST] 00000032 Container I org.openqa.jetty.util.Container start Started org.openqa.jetty.jetty.servlet.ServletHandler@8090809
    [18/07/13 10.04.21:715 CEST] 00000032 Container I org.openqa.jetty.util.Container start Started HttpContext[/wd,/wd]
    [18/07/13 10.04.21:717 CEST] 00000032 Container I org.openqa.jetty.util.Container start Started HttpContext[/selenium-server/driver,/selenium-server/driver]
    [18/07/13 10.04.21:719 CEST] 00000032 Container I org.openqa.jetty.util.Container start Started HttpContext[/,/]
    [18/07/13 10.04.21:761 CEST] 00000032 SocketListene I org.openqa.jetty.http.SocketListener start Started SocketListener on 0.0.0.0:4444
    [18/07/13 10.04.21:763 CEST] 00000032 Container I org.openqa.jetty.util.Container start Started org.openqa.jetty.jetty.Server@48f448f4
    [18/07/13 10.04.21:769 CEST] 00000032 SystemOut O === 2013-07-18 10:04:21,769 [ : 5] INFO SeleniumServerHelper - Selenium server started
    [18/07/13 10.04.21:931 CEST] 00000034 ThreadedServe I org.openqa.jetty.util.ThreadedServer$Acceptor run Stopping Acceptor ServerSocket[addr=0.0.0.0/0.0.0.0,port=0,localport=4444]
    [18/07/13 10.04.22:030 CEST] 00000032 SocketListene I org.openqa.jetty.http.SocketListener stop Stopped SocketListener on 0.0.0.0:4444
    [18/07/13 10.04.22:201 CEST] 00000032 Container I org.openqa.jetty.util.Container stop Stopped HttpContext[/selenium-server,/selenium-server]
    [18/07/13 10.04.22:203 CEST] 00000032 Container I org.openqa.jetty.util.Container stop Stopped org.openqa.jetty.jetty.servlet.ServletHandler@8090809
    [18/07/13 10.04.22:367 CEST] 00000032 Container I org.openqa.jetty.util.Container stop Stopped HttpContext[/wd,/wd]
    [18/07/13 10.04.22:415 CEST] 00000032 Container I org.openqa.jetty.util.Container stop Stopped HttpContext[/selenium-server/driver,/selenium-server/driver]
    [18/07/13 10.04.22:522 CEST] 00000032 Container I org.openqa.jetty.util.Container stop Stopped HttpContext[/,/]
    [18/07/13 10.04.22:524 CEST] 00000032 Container I org.openqa.jetty.util.Container stop Stopped org.openqa.jetty.jetty.Server@48f448f4
    [18/07/13 10.04.22:525 CEST] 00000032 SystemOut O === 2013-07-18 10:04:22,525 [ : 5] INFO SeleniumServerHelper - Selenium server stopped
    [18/07/13 10.04.22:526 CEST] 00000032 SystemOut O === 2013-07-18 10:04:22,526 [ : 5] DEBUG DSRequest - Caching instance 18 of DS batchRun from DSRequest.getDataSource()
    [18/07/13 10.04.22:526 CEST] 00000032 SystemOut O === 2013-07-18 10:04:22,526 [ : 5] DEBUG DeclarativeSecurity - Processing security checks for DataSource null, field null
    [18/07/13 10.04.22:527 CEST] 00000032 SystemOut O === 2013-07-18 10:04:22,527 [ : 5] DEBUG AppBase - [builtinApplication.null] No userTypes defined, allowing anyone access to all operations for this application
    [18/07/13 10.04.22:527 CEST] 00000032 SystemOut O === 2013-07-18 10:04:22,527 [ : 5] DEBUG AppBase - [builtinApplication.null] No public zero-argument method named '_null' found, performing generic datasource operation
    [18/07/13 10.04.22:527 CEST] 00000032 SystemOut O === 2013-07-18 10:04:22,527 [ : 5] INFO SQLDataSource - [builtinApplication.null] Performing update operation with
    criteria: {batchStartTime:new Date(1374134658000)} values: {batchEndTime:new Date(1374134662526)}
    [18/07/13 10.04.22:528 CEST] 00000032 SystemOut O === 2013-07-18 10:04:22,528 [ : 5] WARN SQLDriver - [builtinApplication.null] DSRequest has no RPCManager set when testing if we should join a transaction - transaction will not be joined
    [18/07/13 10.04.22:528 CEST] 00000032 SystemOut O === 2013-07-18 10:04:22,528 [ : 5] DEBUG SQLConnectionManager - [builtinApplication.null] Borrowed connection '100992517'
    [18/07/13 10.04.22:528 CEST] 00000032 SystemOut O === 2013-07-18 10:04:22,528 [ : 5] DEBUG SQLDriver - [builtinApplication.null] About to execute SQL update in 'DB2' using connection'100992517'
    [18/07/13 10.04.22:528 CEST] 00000032 SystemOut O === 2013-07-18 10:04:22,528 [ : 5] INFO SQLDriver - [builtinApplication.null] Executing SQL update on 'DB2': UPDATE batchRun SET batchEndTime='2013-07-18 10:04:22' WHERE (batchRun.batchStartTime='2013-07-18 10:04:18')
    [18/07/13 10.04.22:597 CEST] 00000032 SystemOut O === 2013-07-18 10:04:22,597 [ : 5] DEBUG SQLDataSource - [builtinApplication.null] update operation affected 1 rows
    [18/07/13 10.04.22:597 CEST] 00000032 SystemOut O === 2013-07-18 10:04:22,597 [ : 5] DEBUG SQLDriver - Freeing SQLDriver dbConnection 100992517
    [18/07/13 10.04.22:598 CEST] 00000032 SystemOut O === 2013-07-18 10:04:22,598 [ : 5] DEBUG SQLConnectionManager - About to close PoolableConnection with hashcode "100992517"

    As you can see, TestRunner starts and successfully writes the execution log into the batchRun table, but it does not process any *.rctest.html file (it does not write into the testResult table).
    It seems that TestRunner is not able to find the *.rctest.html files.


    We used this link as documentation: http://www.smartclient.com/smartgwte...estRunner.html.
    Is there any more available?

    Could you help us?


    Thanks in advance for you support.

    pcocchi
    Last edited by pcocchi; 18 Jul 2013, 03:58.

    #2
    I does look like there's a JAR missing in our deployed zip which is preventing the "files" option from working. If you can comment out the call to driver.setFiles(files) for now, that may get things working.

    We'll make sure that missing JAR is added to the zip when the next nightly build occurs.

    Comment


      #3
      I tried to comment out the call to driver.setFiles(files), but the result is the same, no file is processed.

      Thank you for you support, we'll wait the next build.

      pcocchi

      Comment


        #4
        Launching using TestRunnerDriver (without setFiles()) was verified last night on both Windows and Linux for SGWT 4.0 Power, so we're not able to reproduce your behavior.

        You may want to double check the value of

        Code:
        System.getProperty("user.install.root") + "\\" + "selenium_testRoot"
        in Java to make sure it's a valid path. You may also want to try running test_runner.bat from the console with the same parameters to see whether that works.

        Comment


          #5
          We checked that path and it is correct.
          Could you give us details about your test on TestRunner? Could you provide some examples?
          We need to launch it from servlet.

          Thank you.

          pcocchi

          Comment


            #6
            The more information you provide, the more likely it is we'll be able to solve the problem.

            Can you provide the actual value of the Java path expression from your code that I quoted in my previous post? I realize it will be specific to your machine, but I'd like to see it nevertheless.

            The point of asking whether the command-line invocation of TestRunner works for you is not to suggest a permanent solution, but to help isolate the problem. If that works - either running using the default test root, or running the tests in your target directory - then it narrows the possible problem space considerably for what's gone wrong with the Java Launch.



            Below is the Test.java that I used to verify correct behavior on a Windows XP machine. Note that the separate machine at IP 192.168.100.5 was running the same SGWT 4.0 pro version and acted as the target server for the test run.

            Code:
            import com.isomorphic.autotest.TestRunnerDriver;
            
            public class Test {
            
                public static void main(String[] args) {
            
                    try {
            
                    TestRunnerDriver driver = new TestRunnerDriver();
                    driver.setTestRoot("c:\\temp\\smartgwtee-4.0p\\tests");
                    driver.setBatchCommit(true);
                    driver.setHttpTarget("192.168.100.5");
            
                    String[] files = {"sqlConnector-1.rctest.html"};
                    driver.setFiles(files);
            
                    driver.run();
            
                    } catch (Throwable t) {
                        System.err.println(t);
                    }
            
                }
            
            }

            Comment


              #7
              I tested the command line invocation.
              To run this test, i put my macro file (test1.rctest.html) into "tests" folder found in your package root (i think this is the default) and i modified the file C:/Users/pcocchi/Desktop/smartgwtpower-4.0p-20130720/smartgwtpower-4.0p/
              selenium/server.properties with custom settings.
              The result is the same:


              C:\Users\pcocchi\Desktop\smartgwtpower-4.0p-20130720\smartgwtpower-4.0p>test_runner.bat

              Using user-defined JAVA_HOME: "C:\Program Files\Java\jre6"

              Sottodirectory o file showcase già esistente.
              "Installing schema ds.xml files..."
              "jar" non è riconosciuto come comando interno o esterno,
              un programma eseguibile o un file batch.
              Impossibile trovare il percorso specificato.
              Impossibile trovare il file specificato.
              ISC: Configuring log4j from: file:/C:/workspace/InternalCom/war/WEB-INF/classes/log4j.isc.config.xml
              === 2013-07-23 15:20:40,282 [main] INFO ISCInit - Isomorphic SmartClient/SmartGWT Framework - Initializing
              === 2013-07-23 15:20:40,288 [main] INFO ConfigLoader - Attempting to load framework.properties from CLASSPATH
              === 2013-07-23 15:20:40,387 [main] INFO ConfigLoader - Successfully loaded framework.properties from CLASSPATH at location: jar:file:/C:/Users/pcocchi/Desktop/smartgwtpower-4.0p-20130720/smartgwtpowe
              r-4.0p/lib/isomorphic_core_rpc.jar!/framework.properties
              === 2013-07-23 15:20:40,387 [main] INFO ConfigLoader - Attempting to load project.properties from CLASSPATH
              === 2013-07-23 15:20:40,388 [main] INFO ConfigLoader - Unable to locate project.properties in CLASSPATH
              === 2013-07-23 15:20:40,394 [main] INFO ConfigLoader - Successfully loaded isc_interfaces.properties from CLASSPATH at location: jar:file:/C:/Users/pcocchi/Desktop/smartgwtpower-4.0p-20130720/smartgw
              tpower-4.0p/lib/isomorphic_core_rpc.jar!/isc_interfaces.properties
              === 2013-07-23 15:20:40,394 [main] INFO ConfigLoader - Attempting to load server.properties from CLASSPATH
              === 2013-07-23 15:20:40,401 [main] INFO ConfigLoader - Successfully loaded server.properties from CLASSPATH at location: file:/C:/Users/pcocchi/Desktop/smartgwtpower-4.0p-20130720/smartgwtpower-4.0p/
              selenium/server.properties
              === 2013-07-23 15:20:40,408 [main] INFO Logger - Logging system started.
              === 2013-07-23 15:20:40,411 [main] INFO ISCInit - Using Configured webRoot: C:/workspace/InternalCom/war
              === 2013-07-23 15:20:40,413 [main] INFO ISCInit - Isomorphic SmartClient/SmartGWT Framework (v9.0p_2013-07-20/PowerEdition Deployment 2013-07-20) - Initialization Complete
              === 2013-07-23 15:20:40,431 [main] INFO TestRunnerConfiguration - Found valid container fileRoot: C:/workspace/InternalCom/war
              === 2013-07-23 15:20:40,500 [main] DEBUG XML - Parsed XML from C:\workspace\InternalCom\war\internalcom\sc\system\schema\builtinTypes.xml: 7ms
              === 2013-07-23 15:20:40,527 [main] INFO PoolManager - SmartClient pooling started for 'simpleTypes' objects
              === 2013-07-23 15:20:40,602 [main] DEBUG XML - Parsed XML from C:\workspace\InternalCom\war\ds\batchRun.ds.xml: 2ms
              === 2013-07-23 15:20:40,610 [main] DEBUG XML - Parsed XML from C:\workspace\InternalCom\war\internalcom\sc\system\schema\DataSource.ds.xml: 7ms
              === 2013-07-23 15:20:40,683 [main] DEBUG XML - Parsed XML from C:\workspace\InternalCom\war\internalcom\sc\system\schema\DataSourceField.ds.xml: 7ms
              === 2013-07-23 15:20:40,727 [main] DEBUG XML - Parsed XML from C:\workspace\InternalCom\war\internalcom\sc\system\schema\OperationBinding.ds.xml: 4ms
              === 2013-07-23 15:20:40,782 [main] DEBUG DSRequest - Caching instance 9 of DS batchRun from DSRequest.getDataSource()
              === 2013-07-23 15:20:40,786 [main] DEBUG DeclarativeSecurity - Processing security checks for DataSource null, field null
              === 2013-07-23 15:20:40,790 [main] DEBUG AppBase - [builtinApplication.null] No userTypes defined, allowing anyone access to all operations for this application
              === 2013-07-23 15:20:40,791 [main] DEBUG AppBase - [builtinApplication.null] No public zero-argument method named '_null' found, performing generic datasource operation
              === 2013-07-23 15:20:40,794 [main] INFO SQLDataSource - [builtinApplication.null] Performing add operation with
              criteria: {branch:"MAIN",batchStartTime:new Date(1374585640000),log:null,user:null} values: {branch:"MAIN",batchStartTime:new Date(1374585640000),log:null,user:null}
              === 2013-07-23 15:20:40,797 [main] DEBUG SQLValuesClause - [builtinApplication.null] Sequences: {id=__default}
              log4j:WARN No appenders could be found for logger (org.apache.Velocity).
              log4j:WARN Please initialize the log4j system properly.
              === 2013-07-23 15:20:40,889 [main] WARN SQLDriver - [builtinApplication.null] DSRequest has no RPCManager set when testing if we should join a transaction - transaction will not be joined
              === 2013-07-23 15:20:40,934 [main] INFO PoolManager - [builtinApplication.null] SmartClient pooling started for 'DB2' objects
              === 2013-07-23 15:20:40,934 [main] DEBUG PoolableSQLConnectionFactory - [builtinApplication.null] Initializing SQL config for 'DB2' from system config - using DataSource: com.ibm.as400.access.AS400JD
              BCConnectionPoolDataSource
              === 2013-07-23 15:20:41,004 [main] INFO DataTools - [builtinApplication.null] setProperties: couldn't set:
              {
              portNumber:"No such property"
              }
              === 2013-07-23 15:20:41,126 [main] DEBUG PoolableSQLConnectionFactory - [builtinApplication.null] makeObject() created a pooled Connection '371838604'
              === 2013-07-23 15:20:41,129 [main] DEBUG SQLConnectionManager - [builtinApplication.null] Borrowed connection '371838604'
              === 2013-07-23 15:20:41,130 [main] DEBUG SQLDriver - [builtinApplication.null] About to execute SQL update in 'DB2' using connection'371838604'
              === 2013-07-23 15:20:41,130 [main] INFO SQLDriver - [builtinApplication.null] Executing SQL update on 'DB2': INSERT INTO batchRun (batchStartTime, branch, log, user) VALUES ('2013-07-23 15:20:40', 'M
              AIN', NULL, NULL)
              === 2013-07-23 15:20:41,440 [main] DEBUG SQLDataSource - [builtinApplication.null] add operation affected 1 rows
              === 2013-07-23 15:20:41,441 [main] INFO SQLDataSource - [builtinApplication.null] primaryKeys: {}
              === 2013-07-23 15:20:41,442 [main] DEBUG DeclarativeSecurity - [builtinApplication.null] Processing security checks for DataSource null, field null
              === 2013-07-23 15:20:41,442 [main] DEBUG AppBase - [builtinApplication.null, builtinApplication.null] No userTypes defined, allowing anyone access to all operations for this application
              === 2013-07-23 15:20:41,443 [main] DEBUG AppBase - [builtinApplication.null, builtinApplication.null] No public zero-argument method named '_null' found, performing generic datasource operation
              === 2013-07-23 15:20:41,444 [main] INFO SQLDataSource - [builtinApplication.null, builtinApplication.null] Performing fetch operation with
              criteria: {} values: {}
              === 2013-07-23 15:20:41,455 [main] INFO SQLWhereClause - [builtinApplication.null, builtinApplication.null] empty condition
              === 2013-07-23 15:20:41,456 [main] INFO SQLDataSource - [builtinApplication.null, builtinApplication.null] derived query: SELECT $defaultSelectClause FROM $defaultTableClause WHERE $defaultWhereClaus
              e
              === 2013-07-23 15:20:41,457 [main] INFO SQLDataSource - [builtinApplication.null, builtinApplication.null] 9: Executing SQL query on 'DB2': SELECT batchRun.batchEndTime, batchRun.batchStartTime, batc
              hRun.branch, batchRun.id, batchRun.log, batchRun.user FROM batchRun WHERE ('1'='1')
              === 2013-07-23 15:20:41,458 [main] DEBUG SQLDriver - [builtinApplication.null, builtinApplication.null] About to execute SQL query in 'DB2' using connection '371838604'
              === 2013-07-23 15:20:41,467 [main] INFO SQLDriver - [builtinApplication.null, builtinApplication.null] Executing SQL query on 'DB2': SELECT batchRun.batchEndTime, batchRun.batchStartTime, batchRun.br
              anch, batchRun.id, batchRun.log, batchRun.user FROM batchRun WHERE ('1'='1')
              === 2013-07-23 15:20:41,540 [main] INFO DSResponse - [builtinApplication.null, builtinApplication.null] DSResponse: List with 31 items
              === 2013-07-23 15:20:41,541 [main] INFO DSResponse - [builtinApplication.null] DSResponse: List with 31 items
              === 2013-07-23 15:20:41,542 [main] DEBUG SQLDriver - Freeing SQLDriver dbConnection 371838604
              === 2013-07-23 15:20:41,545 [main] DEBUG SQLConnectionManager - About to close PoolableConnection with hashcode "371838604"
              === 2013-07-23 15:20:41,817 [main] INFO SeleniumServerHelper - Selenium server started
              === 2013-07-23 15:20:42,045 [main] INFO SeleniumServerHelper - Selenium server stopped
              === 2013-07-23 15:20:42,047 [main] DEBUG DSRequest - Caching instance 9 of DS batchRun from DSRequest.getDataSource()
              === 2013-07-23 15:20:42,048 [main] DEBUG DeclarativeSecurity - Processing security checks for DataSource null, field null
              === 2013-07-23 15:20:42,050 [main] DEBUG AppBase - [builtinApplication.null] No userTypes defined, allowing anyone access to all operations for this application
              === 2013-07-23 15:20:42,055 [main] DEBUG AppBase - [builtinApplication.null] No public zero-argument method named '_null' found, performing generic datasource operation
              === 2013-07-23 15:20:42,058 [main] INFO SQLDataSource - [builtinApplication.null] Performing update operation with
              criteria: {batchStartTime:new Date(1374585640000)} values: {batchEndTime:new Date(1374585642047)}
              === 2013-07-23 15:20:42,061 [main] WARN SQLDriver - [builtinApplication.null] DSRequest has no RPCManager set when testing if we should join a transaction - transaction will not be joined
              === 2013-07-23 15:20:42,063 [main] DEBUG SQLConnectionManager - [builtinApplication.null] Borrowed connection '371838604'
              === 2013-07-23 15:20:42,065 [main] DEBUG SQLDriver - [builtinApplication.null] About to execute SQL update in 'DB2' using connection'371838604'
              === 2013-07-23 15:20:42,066 [main] INFO SQLDriver - [builtinApplication.null] Executing SQL update on 'DB2': UPDATE batchRun SET batchEndTime='2013-07-23 15:20:42' WHERE (batchRun.batchStartTime='201
              3-07-23 15:20:40')
              === 2013-07-23 15:20:42,100 [main] DEBUG SQLDataSource - [builtinApplication.null] update operation affected 1 rows
              === 2013-07-23 15:20:42,100 [main] DEBUG SQLDriver - Freeing SQLDriver dbConnection 371838604
              === 2013-07-23 15:20:42,101 [main] DEBUG SQLConnectionManager - About to close PoolableConnection with hashcode "371838604"


              The value of System.getProperty("user.install.root") + "\\" + "selenium_testRoot" is "C:\Program Files (x86)\IBM\SDP\runtimes\base_v7\profiles\AppSrv01\selenium_testRoot".
              I also tested other shortest paths, but with same results.


              pcocchi
              Last edited by pcocchi; 23 Jul 2013, 05:32.

              Comment


                #8
                You're getting errors when you start test_runner.bat. It looks like we expect jar.exe to be in your %PATH%. Try adding this and then run test_runner.bat again with a fresh install of the zip. (We can fix the script to use %JAVA_HOME% but that will have to wait for the next build.)

                What changes to server.properties are you making? Try this, after installing the zip (with the environment modification mentioned above), try running test_runner.bat with no file modifications - just run with our default test in the stock location.

                Comment


                  #9
                  I added jar.exe into %PATH% and run test_runner.bat into his stock folder.

                  I changed the datasource parameters into selenium/server.properties to make available batchRun and testResult tables.
                  If i use the default datasource parameters, i have the following error:

                  Exception in thread "main" java.sql.SQLSyntaxErrorException: user lacks privilege or object not found: BATCHRUN
                  at org.hsqldb.jdbc.Util.sqlException(Unknown Source)
                  at org.hsqldb.jdbc.Util.sqlException(Unknown Source)
                  at org.hsqldb.jdbc.JDBCPreparedStatement.<init>(Unknown Source)
                  at org.hsqldb.jdbc.JDBCConnection.prepareStatement(Unknown Source)
                  at com.isomorphic.sql.SQLDriver.getPreparedStatement(SQLDriver.java:836)
                  at com.isomorphic.sql.SQLDriver.doUpdate(SQLDriver.java:797)
                  at com.isomorphic.sql.SQLDriver.update(SQLDriver.java:776)
                  at com.isomorphic.sql.SQLDriver.executeUpdate(SQLDriver.java:889)
                  at com.isomorphic.sql.SQLDataSource.executeNativeUpdate(SQLDataSource.java:533)
                  at com.isomorphic.sql.SQLDataSource.SQLExecute(SQLDataSource.java:1623)
                  at com.isomorphic.sql.SQLDataSource.processRequest(SQLDataSource.java:408)
                  at com.isomorphic.sql.SQLDataSource.executeAdd(SQLDataSource.java:360)
                  at com.isomorphic.datasource.DataSource.execute(DataSource.java:1447)
                  at com.isomorphic.application.AppBase.executeDefaultDSOperation(AppBase.java:726)
                  at com.isomorphic.application.AppBase.executeAppOperation(AppBase.java:658)
                  at com.isomorphic.application.AppBase.execute(AppBase.java:491)
                  at com.isomorphic.datasource.DSRequest.execute(DSRequest.java:2412)
                  at com.isomorphic.autotest.BatchRunDao.add(BatchRunDao.java:72)
                  at com.isomorphic.autotest.TestRunner.createBatchRunRecord(TestRunner.java:277)
                  at com.isomorphic.autotest.TestRunnerLauncher.launch(TestRunnerLauncher.java:324)
                  at com.isomorphic.autotest.TestRunnerLauncher.launch(TestRunnerLauncher.java:711)
                  at com.isomorphic.autotest.TestRunner.main(TestRunner.java:128)
                  Caused by: org.hsqldb.HsqlException: user lacks privilege or object not found: BATCHRUN
                  at org.hsqldb.error.Error.error(Unknown Source)
                  at org.hsqldb.error.Error.error(Unknown Source)
                  at org.hsqldb.SchemaManager.getTable(Unknown Source)
                  at org.hsqldb.ParserDQL.readTableName(Unknown Source)
                  at org.hsqldb.ParserDQL.readRangeVariableForDataChange(Unknown Source)
                  at org.hsqldb.ParserDML.compileInsertStatement(Unknown Source)
                  at org.hsqldb.ParserCommand.compilePart(Unknown Source)
                  at org.hsqldb.ParserCommand.compileStatement(Unknown Source)
                  at org.hsqldb.Session.compileStatement(Unknown Source)
                  at org.hsqldb.StatementManager.compile(Unknown Source)
                  at org.hsqldb.Session.execute(Unknown Source)
                  ... 20 more


                  With the new execution i have a new error. This is the output:

                  C:\Users\pcocchi\Desktop\smartgwtpower-4.0p>test_runner.bat

                  Using user-defined JAVA_HOME: "C:\Program Files\Java\jre6"

                  Sottodirectory o file showcase già esistente.
                  "Installing schema ds.xml files..."
                  1 directory spostata/e.
                  ISC: Configuring log4j from: file:/C:/Users/pcocchi/Desktop/smartgwtpower-4.0p/samples/showcase/war/WEB-INF/classes/log4j.isc.config.xml
                  === 2013-07-24 09:57:44,469 [main] INFO ISCInit - Isomorphic SmartClient/SmartGWT Framework - Initializing
                  === 2013-07-24 09:57:44,474 [main] INFO ConfigLoader - Attempting to load framework.properties from CLASSPATH
                  === 2013-07-24 09:57:44,580 [main] INFO ConfigLoader - Successfully loaded framework.properties from CLASSPATH at location: jar:file:/C:/Users/pcocchi/Desktop/smartgwtpower-4.0p/lib/isomorphic_core_r
                  pc.jar!/framework.properties
                  === 2013-07-24 09:57:44,580 [main] INFO ConfigLoader - Attempting to load project.properties from CLASSPATH
                  === 2013-07-24 09:57:44,581 [main] INFO ConfigLoader - Unable to locate project.properties in CLASSPATH
                  === 2013-07-24 09:57:44,586 [main] INFO ConfigLoader - Successfully loaded isc_interfaces.properties from CLASSPATH at location: jar:file:/C:/Users/pcocchi/Desktop/smartgwtpower-4.0p/lib/isomorphic_c
                  ore_rpc.jar!/isc_interfaces.properties
                  === 2013-07-24 09:57:44,586 [main] INFO ConfigLoader - Attempting to load server.properties from CLASSPATH
                  === 2013-07-24 09:57:44,593 [main] INFO ConfigLoader - Successfully loaded server.properties from CLASSPATH at location: file:/C:/Users/pcocchi/Desktop/smartgwtpower-4.0p/selenium/server.properties
                  === 2013-07-24 09:57:44,601 [main] INFO Logger - Logging system started.
                  === 2013-07-24 09:57:44,602 [main] INFO ISCInit - No ServletContext available yet - using container IO for now
                  === 2013-07-24 09:57:44,603 [main] INFO ISCInit - Isomorphic SmartClient/SmartGWT Framework (v9.0p_2013-07-20/PowerEdition Deployment 2013-07-20) - Initialization Complete
                  === 2013-07-24 09:57:44,623 [main] INFO TestRunnerConfiguration - Setting fileRoot as C:/Users/pcocchi/Desktop/smartgwtpower-4.0p
                  === 2013-07-24 09:57:44,647 [main] INFO ISCInit - No ServletContext available yet - using container IO for now
                  === 2013-07-24 09:57:44,699 [main] DEBUG XML - Parsed XML from C:\Users\pcocchi\Desktop\smartgwtpower-4.0p\showcase\sc\system\schema\builtinTypes.xml: 7ms
                  === 2013-07-24 09:57:44,728 [main] INFO PoolManager - SmartClient pooling started for 'simpleTypes' objects
                  === 2013-07-24 09:57:44,837 [main] DEBUG XML - Parsed XML from C:\Users\pcocchi\Desktop\smartgwtpower-4.0p\selenium\batchRun.ds.xml: 3ms
                  === 2013-07-24 09:57:44,847 [main] DEBUG XML - Parsed XML from C:\Users\pcocchi\Desktop\smartgwtpower-4.0p\showcase\sc\system\schema\DataSource.ds.xml: 6ms
                  === 2013-07-24 09:57:44,925 [main] DEBUG XML - Parsed XML from C:\Users\pcocchi\Desktop\smartgwtpower-4.0p\showcase\sc\system\schema\DataSourceField.ds.xml: 7ms
                  === 2013-07-24 09:57:44,976 [main] DEBUG XML - Parsed XML from C:\Users\pcocchi\Desktop\smartgwtpower-4.0p\showcase\sc\system\schema\OperationBinding.ds.xml: 4ms
                  === 2013-07-24 09:57:45,037 [main] DEBUG DSRequest - Caching instance 9 of DS batchRun from DSRequest.getDataSource()
                  === 2013-07-24 09:57:45,041 [main] DEBUG DeclarativeSecurity - Processing security checks for DataSource null, field null
                  === 2013-07-24 09:57:45,046 [main] DEBUG AppBase - [builtinApplication.null] No userTypes defined, allowing anyone access to all operations for this application
                  === 2013-07-24 09:57:45,047 [main] DEBUG AppBase - [builtinApplication.null] No public zero-argument method named '_null' found, performing generic datasource operation
                  === 2013-07-24 09:57:45,051 [main] INFO SQLDataSource - [builtinApplication.null] Performing add operation with
                  criteria: {branch:"MAIN",batchStartTime:new Date(1374652664000),log:null,user:null} values: {branch:"MAIN",batchStartTime:new Date(1374652664000),log:null,user:null}
                  === 2013-07-24 09:57:45,054 [main] DEBUG SQLValuesClause - [builtinApplication.null] Sequences: {id=__default}
                  log4j:WARN No appenders could be found for logger (org.apache.Velocity).
                  log4j:WARN Please initialize the log4j system properly.
                  === 2013-07-24 09:57:45,158 [main] WARN SQLDriver - [builtinApplication.null] DSRequest has no RPCManager set when testing if we should join a transaction - transaction will not be joined
                  === 2013-07-24 09:57:45,203 [main] INFO PoolManager - [builtinApplication.null] SmartClient pooling started for 'DB2' objects
                  === 2013-07-24 09:57:45,204 [main] DEBUG PoolableSQLConnectionFactory - [builtinApplication.null] Initializing SQL config for 'DB2' from system config - using DataSource: com.ibm.as400.access.AS400JD
                  BCConnectionPoolDataSource
                  === 2013-07-24 09:57:46,185 [main] INFO DataTools - [builtinApplication.null] setProperties: couldn't set:
                  {
                  portNumber:"No such property"
                  }
                  === 2013-07-24 09:57:46,599 [main] DEBUG PoolableSQLConnectionFactory - [builtinApplication.null] makeObject() created a pooled Connection '845913220'
                  === 2013-07-24 09:57:46,639 [main] DEBUG SQLConnectionManager - [builtinApplication.null] Borrowed connection '845913220'
                  === 2013-07-24 09:57:46,640 [main] DEBUG SQLDriver - [builtinApplication.null] About to execute SQL update in 'DB2' using connection'845913220'
                  === 2013-07-24 09:57:46,640 [main] INFO SQLDriver - [builtinApplication.null] Executing SQL update on 'DB2': INSERT INTO batchRun (batchStartTime, branch, log, user) VALUES ('2013-07-24 09:57:44', 'M
                  AIN', NULL, NULL)
                  === 2013-07-24 09:57:46,930 [main] DEBUG SQLDataSource - [builtinApplication.null] add operation affected 1 rows
                  === 2013-07-24 09:57:46,930 [main] INFO SQLDataSource - [builtinApplication.null] primaryKeys: {}
                  === 2013-07-24 09:57:46,931 [main] DEBUG DeclarativeSecurity - [builtinApplication.null] Processing security checks for DataSource null, field null
                  === 2013-07-24 09:57:46,931 [main] DEBUG AppBase - [builtinApplication.null, builtinApplication.null] No userTypes defined, allowing anyone access to all operations for this application
                  === 2013-07-24 09:57:46,932 [main] DEBUG AppBase - [builtinApplication.null, builtinApplication.null] No public zero-argument method named '_null' found, performing generic datasource operation
                  === 2013-07-24 09:57:46,933 [main] INFO SQLDataSource - [builtinApplication.null, builtinApplication.null] Performing fetch operation with
                  criteria: {} values: {}
                  === 2013-07-24 09:57:46,977 [main] INFO SQLWhereClause - [builtinApplication.null, builtinApplication.null] empty condition
                  === 2013-07-24 09:57:46,978 [main] INFO SQLDataSource - [builtinApplication.null, builtinApplication.null] derived query: SELECT $defaultSelectClause FROM $defaultTableClause WHERE $defaultWhereClaus
                  e
                  === 2013-07-24 09:57:46,979 [main] INFO SQLDataSource - [builtinApplication.null, builtinApplication.null] 9: Executing SQL query on 'DB2': SELECT batchRun.batchEndTime, batchRun.batchStartTime, batc
                  hRun.branch, batchRun.id, batchRun.log, batchRun.user FROM batchRun WHERE ('1'='1')
                  === 2013-07-24 09:57:46,979 [main] DEBUG SQLDriver - [builtinApplication.null, builtinApplication.null] About to execute SQL query in 'DB2' using connection '845913220'
                  === 2013-07-24 09:57:46,980 [main] INFO SQLDriver - [builtinApplication.null, builtinApplication.null] Executing SQL query on 'DB2': SELECT batchRun.batchEndTime, batchRun.batchStartTime, batchRun.br
                  anch, batchRun.id, batchRun.log, batchRun.user FROM batchRun WHERE ('1'='1')
                  === 2013-07-24 09:57:47,065 [main] INFO DSResponse - [builtinApplication.null, builtinApplication.null] DSResponse: List with 41 items
                  === 2013-07-24 09:57:47,066 [main] INFO DSResponse - [builtinApplication.null] DSResponse: List with 41 items
                  === 2013-07-24 09:57:47,066 [main] DEBUG SQLDriver - Freeing SQLDriver dbConnection 845913220
                  === 2013-07-24 09:57:47,070 [main] DEBUG SQLConnectionManager - About to close PoolableConnection with hashcode "845913220"
                  === 2013-07-24 09:57:51,391 [main] INFO SeleniumServerHelper - Selenium server started
                  === 2013-07-24 09:57:52,528 [main] DEBUG DSRequest - Caching instance 9 of DS batchRun from DSRequest.getDataSource()
                  === 2013-07-24 09:57:52,528 [main] DEBUG DeclarativeSecurity - Processing security checks for DataSource null, field null
                  === 2013-07-24 09:57:52,529 [main] DEBUG AppBase - [builtinApplication.null] No userTypes defined, allowing anyone access to all operations for this application
                  === 2013-07-24 09:57:52,533 [main] DEBUG AppBase - [builtinApplication.null] No public zero-argument method named '_null' found, performing generic datasource operation
                  === 2013-07-24 09:57:52,537 [main] INFO SQLDataSource - [builtinApplication.null] Performing update operation with
                  criteria: {batchStartTime:new Date(1374652664000)} values: {batchEndTime:new Date(1374652672528)}
                  === 2013-07-24 09:57:52,541 [main] WARN SQLDriver - [builtinApplication.null] DSRequest has no RPCManager set when testing if we should join a transaction - transaction will not be joined
                  === 2013-07-24 09:57:52,542 [main] DEBUG SQLConnectionManager - [builtinApplication.null] Borrowed connection '845913220'
                  === 2013-07-24 09:57:52,543 [main] DEBUG SQLDriver - [builtinApplication.null] About to execute SQL update in 'DB2' using connection'845913220'
                  === 2013-07-24 09:57:52,544 [main] INFO SQLDriver - [builtinApplication.null] Executing SQL update on 'DB2': UPDATE batchRun SET batchEndTime='2013-07-24 09:57:52' WHERE (batchRun.batchStartTime='201
                  3-07-24 09:57:44')
                  === 2013-07-24 09:57:52,611 [main] DEBUG SQLDataSource - [builtinApplication.null] update operation affected 1 rows
                  === 2013-07-24 09:57:52,612 [main] DEBUG SQLDriver - Freeing SQLDriver dbConnection 845913220
                  === 2013-07-24 09:57:52,612 [main] DEBUG SQLConnectionManager - About to close PoolableConnection with hashcode "845913220"
                  Exception in thread "main" java.lang.IllegalArgumentException: resource /customProfileDirCUSTFFCHROME relative to org.openqa.selenium.server.browserlaunchers.FirefoxChromeLauncher not found.
                  at com.google.common.base.Preconditions.checkArgument(Preconditions.java:119)
                  at com.google.common.io.Resources.getResource(Resources.java:169)
                  at org.openqa.selenium.server.browserlaunchers.ResourceExtractor.extractResourcePath(ResourceExtractor.java:51)
                  at org.openqa.selenium.server.browserlaunchers.FirefoxChromeLauncher.extractProfileFromJar(FirefoxChromeLauncher.java:181)
                  at org.openqa.selenium.server.browserlaunchers.FirefoxChromeLauncher.makeCustomProfile(FirefoxChromeLauncher.java:223)
                  at org.openqa.selenium.server.browserlaunchers.FirefoxChromeLauncher.launch(FirefoxChromeLauncher.java:89)
                  at org.openqa.selenium.server.browserlaunchers.FirefoxChromeLauncher.launchHTMLSuite(FirefoxChromeLauncher.java:340)
                  at org.openqa.selenium.server.browserlaunchers.FirefoxLauncher.launchHTMLSuite(FirefoxLauncher.java:110)
                  at org.openqa.selenium.server.htmlrunner.HTMLLauncher.runHTMLSuite(HTMLLauncher.java:145)
                  at org.openqa.selenium.server.htmlrunner.HTMLLauncher.runHTMLSuite(HTMLLauncher.java:71)
                  at com.isomorphic.autotest.TestRunnerHelper.testRctest(TestRunnerHelper.java:256)
                  at com.isomorphic.autotest.TestRunnerHelper.processSeleniumTests(TestRunnerHelper.java:120)
                  at com.isomorphic.autotest.TestRunnerHelper.testAll(TestRunnerHelper.java:102)
                  at com.isomorphic.autotest.TestRunner.testAll(TestRunner.java:216)
                  at com.isomorphic.autotest.TestRunnerLauncher.launch(TestRunnerLauncher.java:342)
                  at com.isomorphic.autotest.TestRunnerLauncher.launch(TestRunnerLauncher.java:711)
                  at com.isomorphic.autotest.TestRunner.main(TestRunner.java:128)


                  pcocchi
                  Last edited by pcocchi; 24 Jul 2013, 00:25.

                  Comment


                    #10
                    Originally posted by pcocchi View Post
                    I changed the datasource parameters into selenium/server.properties to make available batchRun and testResult tables.
                    If i use the default datasource parameters, i have the following error:

                    Exception in thread "main" java.sql.SQLSyntaxErrorException: user lacks privilege or object not found: BATCHRUN
                    at org.hsqldb.jdbc.Util.sqlException(Unknown Source)
                    at org.hsqldb.jdbc.Util.sqlException(Unknown Source)
                    at org.hsqldb.jdbc.JDBCPreparedStatement.<init>(Unknown Source)
                    at org.hsqldb.jdbc.JDBCConnection.prepareStatement(Unknown Source)
                    at com.isomorphic.sql.SQLDriver.getPreparedStatement(SQLDriver.java:836)
                    at com.isomorphic.sql.SQLDriver.doUpdate(SQLDriver.java:797)
                    at com.isomorphic.sql.SQLDriver.update(SQLDriver.java:776)
                    at com.isomorphic.sql.SQLDriver.executeUpdate(SQLDriver.java:889)
                    at com.isomorphic.sql.SQLDataSource.executeNativeUpdate(SQLDataSource.java:533)
                    at com.isomorphic.sql.SQLDataSource.SQLExecute(SQLDataSource.java:1623)
                    at com.isomorphic.sql.SQLDataSource.processRequest(SQLDataSource.java:408)
                    at com.isomorphic.sql.SQLDataSource.executeAdd(SQLDataSource.java:360)
                    at com.isomorphic.datasource.DataSource.execute(DataSource.java:1447)
                    at com.isomorphic.application.AppBase.executeDefaultDSOperation(AppBase.java:726)
                    at com.isomorphic.application.AppBase.executeAppOperation(AppBase.java:658)
                    at com.isomorphic.application.AppBase.execute(AppBase.java:491)
                    at com.isomorphic.datasource.DSRequest.execute(DSRequest.java:2412)
                    at com.isomorphic.autotest.BatchRunDao.add(BatchRunDao.java:72)
                    at com.isomorphic.autotest.TestRunner.createBatchRunRecord(TestRunner.java:277)
                    at com.isomorphic.autotest.TestRunnerLauncher.launch(TestRunnerLauncher.java:324)
                    at com.isomorphic.autotest.TestRunnerLauncher.launch(TestRunnerLauncher.java:711)
                    at com.isomorphic.autotest.TestRunner.main(TestRunner.java:128)
                    Caused by: org.hsqldb.HsqlException: user lacks privilege or object not found: BATCHRUN
                    at org.hsqldb.error.Error.error(Unknown Source)
                    at org.hsqldb.error.Error.error(Unknown Source)
                    at org.hsqldb.SchemaManager.getTable(Unknown Source)
                    at org.hsqldb.ParserDQL.readTableName(Unknown Source)
                    at org.hsqldb.ParserDQL.readRangeVariableForDataChange(Unknown Source)
                    at org.hsqldb.ParserDML.compileInsertStatement(Unknown Source)
                    at org.hsqldb.ParserCommand.compilePart(Unknown Source)
                    at org.hsqldb.ParserCommand.compileStatement(Unknown Source)
                    at org.hsqldb.Session.compileStatement(Unknown Source)
                    at org.hsqldb.StatementManager.compile(Unknown Source)
                    at org.hsqldb.Session.execute(Unknown Source)
                    ... 20 more
                    You shouldn't need to modify server.properties to get the basic functionality working. The error you describe is actually addressed by the 2nd question of the "Getting Started FAQ" in the help page you linked to earlier.

                    Q: When I run TestRunner, TestRunner fails reporting that DataSource BatchRun or TestResult cannot be found.
                    A: These DataSources must be imported into the default HSQLDB before TestRunner can be used. Use the "import" option of showcase/tools/adminConsole.jsp under the deployed SGWT showcase to select and import the BatchRun and TestResult DataSources prior to running TestRunner.
                    As mentioned in the first FAQ question, TestRunner uses HSQLDB from the showcase installation under samples/showcase for its storage, so to import the tables mentioned, you'd have to run the showcase as a webapp by pointing (tomcat, or something) at the samples/showcase/war directory. As shipped, the war directory is not complete, so you'll either need to rebuild it in place (if you know how), or populate it by unjaring showcase.war from the top level directory of the zip:

                    Code:
                    cd samples\showcase\war
                    jar xvf ..\..\..\showcase.war
                    Since the goal of this step is simply to import the tables, you could also deploy showcase.war directly, and then (after importing the tables) copy the db directory from the deployed war over samples\showcase\war\WEB-INF\db.

                    Originally posted by pcocchi View Post
                    With the new execution i have a new error. This is the output:

                    C:\Users\pcocchi\Desktop\smartgwtpower-4.0p>test_runner.bat

                    Using user-defined JAVA_HOME: "C:\Program Files\Java\jre6"

                    Sottodirectory o file showcase già esistente.
                    "Installing schema ds.xml files..."
                    1 directory spostata/e.
                    ISC: Configuring log4j from: file:/C:/Users/pcocchi/Desktop/smartgwtpower-4.0p/samples/showcase/war/WEB-INF/classes/log4j.isc.config.xml
                    === 2013-07-24 09:57:44,469 [main] INFO ISCInit - Isomorphic SmartClient/SmartGWT Framework - Initializing
                    === 2013-07-24 09:57:44,474 [main] INFO ConfigLoader - Attempting to load framework.properties from CLASSPATH
                    === 2013-07-24 09:57:44,580 [main] INFO ConfigLoader - Successfully loaded framework.properties from CLASSPATH at location: jar:file:/C:/Users/pcocchi/Desktop/smartgwtpower-4.0p/lib/isomorphic_core_r
                    pc.jar!/framework.properties
                    === 2013-07-24 09:57:44,580 [main] INFO ConfigLoader - Attempting to load project.properties from CLASSPATH
                    === 2013-07-24 09:57:44,581 [main] INFO ConfigLoader - Unable to locate project.properties in CLASSPATH
                    === 2013-07-24 09:57:44,586 [main] INFO ConfigLoader - Successfully loaded isc_interfaces.properties from CLASSPATH at location: jar:file:/C:/Users/pcocchi/Desktop/smartgwtpower-4.0p/lib/isomorphic_c
                    ore_rpc.jar!/isc_interfaces.properties
                    === 2013-07-24 09:57:44,586 [main] INFO ConfigLoader - Attempting to load server.properties from CLASSPATH
                    === 2013-07-24 09:57:44,593 [main] INFO ConfigLoader - Successfully loaded server.properties from CLASSPATH at location: file:/C:/Users/pcocchi/Desktop/smartgwtpower-4.0p/selenium/server.properties
                    === 2013-07-24 09:57:44,601 [main] INFO Logger - Logging system started.
                    === 2013-07-24 09:57:44,602 [main] INFO ISCInit - No ServletContext available yet - using container IO for now
                    === 2013-07-24 09:57:44,603 [main] INFO ISCInit - Isomorphic SmartClient/SmartGWT Framework (v9.0p_2013-07-20/PowerEdition Deployment 2013-07-20) - Initialization Complete
                    === 2013-07-24 09:57:44,623 [main] INFO TestRunnerConfiguration - Setting fileRoot as C:/Users/pcocchi/Desktop/smartgwtpower-4.0p
                    === 2013-07-24 09:57:44,647 [main] INFO ISCInit - No ServletContext available yet - using container IO for now
                    === 2013-07-24 09:57:44,699 [main] DEBUG XML - Parsed XML from C:\Users\pcocchi\Desktop\smartgwtpower-4.0p\showcase\sc\system\schema\builtinTypes.xml: 7ms
                    === 2013-07-24 09:57:44,728 [main] INFO PoolManager - SmartClient pooling started for 'simpleTypes' objects
                    === 2013-07-24 09:57:44,837 [main] DEBUG XML - Parsed XML from C:\Users\pcocchi\Desktop\smartgwtpower-4.0p\selenium\batchRun.ds.xml: 3ms
                    === 2013-07-24 09:57:44,847 [main] DEBUG XML - Parsed XML from C:\Users\pcocchi\Desktop\smartgwtpower-4.0p\showcase\sc\system\schema\DataSource.ds.xml: 6ms
                    === 2013-07-24 09:57:44,925 [main] DEBUG XML - Parsed XML from C:\Users\pcocchi\Desktop\smartgwtpower-4.0p\showcase\sc\system\schema\DataSourceField.ds.xml: 7ms
                    === 2013-07-24 09:57:44,976 [main] DEBUG XML - Parsed XML from C:\Users\pcocchi\Desktop\smartgwtpower-4.0p\showcase\sc\system\schema\OperationBinding.ds.xml: 4ms
                    === 2013-07-24 09:57:45,037 [main] DEBUG DSRequest - Caching instance 9 of DS batchRun from DSRequest.getDataSource()
                    === 2013-07-24 09:57:45,041 [main] DEBUG DeclarativeSecurity - Processing security checks for DataSource null, field null
                    === 2013-07-24 09:57:45,046 [main] DEBUG AppBase - [builtinApplication.null] No userTypes defined, allowing anyone access to all operations for this application
                    === 2013-07-24 09:57:45,047 [main] DEBUG AppBase - [builtinApplication.null] No public zero-argument method named '_null' found, performing generic datasource operation
                    === 2013-07-24 09:57:45,051 [main] INFO SQLDataSource - [builtinApplication.null] Performing add operation with
                    criteria: {branch:"MAIN",batchStartTime:new Date(1374652664000),log:null,user:null} values: {branch:"MAIN",batchStartTime:new Date(1374652664000),log:null,user:null}
                    === 2013-07-24 09:57:45,054 [main] DEBUG SQLValuesClause - [builtinApplication.null] Sequences: {id=__default}
                    log4j:WARN No appenders could be found for logger (org.apache.Velocity).
                    log4j:WARN Please initialize the log4j system properly.
                    === 2013-07-24 09:57:45,158 [main] WARN SQLDriver - [builtinApplication.null] DSRequest has no RPCManager set when testing if we should join a transaction - transaction will not be joined
                    === 2013-07-24 09:57:45,203 [main] INFO PoolManager - [builtinApplication.null] SmartClient pooling started for 'DB2' objects
                    === 2013-07-24 09:57:45,204 [main] DEBUG PoolableSQLConnectionFactory - [builtinApplication.null] Initializing SQL config for 'DB2' from system config - using DataSource: com.ibm.as400.access.AS400JD
                    BCConnectionPoolDataSource
                    === 2013-07-24 09:57:46,185 [main] INFO DataTools - [builtinApplication.null] setProperties: couldn't set:
                    {
                    portNumber:"No such property"
                    }
                    === 2013-07-24 09:57:46,599 [main] DEBUG PoolableSQLConnectionFactory - [builtinApplication.null] makeObject() created a pooled Connection '845913220'
                    === 2013-07-24 09:57:46,639 [main] DEBUG SQLConnectionManager - [builtinApplication.null] Borrowed connection '845913220'
                    === 2013-07-24 09:57:46,640 [main] DEBUG SQLDriver - [builtinApplication.null] About to execute SQL update in 'DB2' using connection'845913220'
                    === 2013-07-24 09:57:46,640 [main] INFO SQLDriver - [builtinApplication.null] Executing SQL update on 'DB2': INSERT INTO batchRun (batchStartTime, branch, log, user) VALUES ('2013-07-24 09:57:44', 'M
                    AIN', NULL, NULL)
                    === 2013-07-24 09:57:46,930 [main] DEBUG SQLDataSource - [builtinApplication.null] add operation affected 1 rows
                    === 2013-07-24 09:57:46,930 [main] INFO SQLDataSource - [builtinApplication.null] primaryKeys: {}
                    === 2013-07-24 09:57:46,931 [main] DEBUG DeclarativeSecurity - [builtinApplication.null] Processing security checks for DataSource null, field null
                    === 2013-07-24 09:57:46,931 [main] DEBUG AppBase - [builtinApplication.null, builtinApplication.null] No userTypes defined, allowing anyone access to all operations for this application
                    === 2013-07-24 09:57:46,932 [main] DEBUG AppBase - [builtinApplication.null, builtinApplication.null] No public zero-argument method named '_null' found, performing generic datasource operation
                    === 2013-07-24 09:57:46,933 [main] INFO SQLDataSource - [builtinApplication.null, builtinApplication.null] Performing fetch operation with
                    criteria: {} values: {}
                    === 2013-07-24 09:57:46,977 [main] INFO SQLWhereClause - [builtinApplication.null, builtinApplication.null] empty condition
                    === 2013-07-24 09:57:46,978 [main] INFO SQLDataSource - [builtinApplication.null, builtinApplication.null] derived query: SELECT $defaultSelectClause FROM $defaultTableClause WHERE $defaultWhereClaus
                    e
                    === 2013-07-24 09:57:46,979 [main] INFO SQLDataSource - [builtinApplication.null, builtinApplication.null] 9: Executing SQL query on 'DB2': SELECT batchRun.batchEndTime, batchRun.batchStartTime, batc
                    hRun.branch, batchRun.id, batchRun.log, batchRun.user FROM batchRun WHERE ('1'='1')
                    === 2013-07-24 09:57:46,979 [main] DEBUG SQLDriver - [builtinApplication.null, builtinApplication.null] About to execute SQL query in 'DB2' using connection '845913220'
                    === 2013-07-24 09:57:46,980 [main] INFO SQLDriver - [builtinApplication.null, builtinApplication.null] Executing SQL query on 'DB2': SELECT batchRun.batchEndTime, batchRun.batchStartTime, batchRun.br
                    anch, batchRun.id, batchRun.log, batchRun.user FROM batchRun WHERE ('1'='1')
                    === 2013-07-24 09:57:47,065 [main] INFO DSResponse - [builtinApplication.null, builtinApplication.null] DSResponse: List with 41 items
                    === 2013-07-24 09:57:47,066 [main] INFO DSResponse - [builtinApplication.null] DSResponse: List with 41 items
                    === 2013-07-24 09:57:47,066 [main] DEBUG SQLDriver - Freeing SQLDriver dbConnection 845913220
                    === 2013-07-24 09:57:47,070 [main] DEBUG SQLConnectionManager - About to close PoolableConnection with hashcode "845913220"
                    === 2013-07-24 09:57:51,391 [main] INFO SeleniumServerHelper - Selenium server started
                    === 2013-07-24 09:57:52,528 [main] DEBUG DSRequest - Caching instance 9 of DS batchRun from DSRequest.getDataSource()
                    === 2013-07-24 09:57:52,528 [main] DEBUG DeclarativeSecurity - Processing security checks for DataSource null, field null
                    === 2013-07-24 09:57:52,529 [main] DEBUG AppBase - [builtinApplication.null] No userTypes defined, allowing anyone access to all operations for this application
                    === 2013-07-24 09:57:52,533 [main] DEBUG AppBase - [builtinApplication.null] No public zero-argument method named '_null' found, performing generic datasource operation
                    === 2013-07-24 09:57:52,537 [main] INFO SQLDataSource - [builtinApplication.null] Performing update operation with
                    criteria: {batchStartTime:new Date(1374652664000)} values: {batchEndTime:new Date(1374652672528)}
                    === 2013-07-24 09:57:52,541 [main] WARN SQLDriver - [builtinApplication.null] DSRequest has no RPCManager set when testing if we should join a transaction - transaction will not be joined
                    === 2013-07-24 09:57:52,542 [main] DEBUG SQLConnectionManager - [builtinApplication.null] Borrowed connection '845913220'
                    === 2013-07-24 09:57:52,543 [main] DEBUG SQLDriver - [builtinApplication.null] About to execute SQL update in 'DB2' using connection'845913220'
                    === 2013-07-24 09:57:52,544 [main] INFO SQLDriver - [builtinApplication.null] Executing SQL update on 'DB2': UPDATE batchRun SET batchEndTime='2013-07-24 09:57:52' WHERE (batchRun.batchStartTime='201
                    3-07-24 09:57:44')
                    === 2013-07-24 09:57:52,611 [main] DEBUG SQLDataSource - [builtinApplication.null] update operation affected 1 rows
                    === 2013-07-24 09:57:52,612 [main] DEBUG SQLDriver - Freeing SQLDriver dbConnection 845913220
                    === 2013-07-24 09:57:52,612 [main] DEBUG SQLConnectionManager - About to close PoolableConnection with hashcode "845913220"
                    Exception in thread "main" java.lang.IllegalArgumentException: resource /customProfileDirCUSTFFCHROME relative to org.openqa.selenium.server.browserlaunchers.FirefoxChromeLauncher not found.
                    at com.google.common.base.Preconditions.checkArgument(Preconditions.java:119)
                    at com.google.common.io.Resources.getResource(Resources.java:169)
                    at org.openqa.selenium.server.browserlaunchers.ResourceExtractor.extractResourcePath(ResourceExtractor.java:51)
                    at org.openqa.selenium.server.browserlaunchers.FirefoxChromeLauncher.extractProfileFromJar(FirefoxChromeLauncher.java:181)
                    at org.openqa.selenium.server.browserlaunchers.FirefoxChromeLauncher.makeCustomProfile(FirefoxChromeLauncher.java:223)
                    at org.openqa.selenium.server.browserlaunchers.FirefoxChromeLauncher.launch(FirefoxChromeLauncher.java:89)
                    at org.openqa.selenium.server.browserlaunchers.FirefoxChromeLauncher.launchHTMLSuite(FirefoxChromeLauncher.java:340)
                    at org.openqa.selenium.server.browserlaunchers.FirefoxLauncher.launchHTMLSuite(FirefoxLauncher.java:110)
                    at org.openqa.selenium.server.htmlrunner.HTMLLauncher.runHTMLSuite(HTMLLauncher.java:145)
                    at org.openqa.selenium.server.htmlrunner.HTMLLauncher.runHTMLSuite(HTMLLauncher.java:71)
                    at com.isomorphic.autotest.TestRunnerHelper.testRctest(TestRunnerHelper.java:256)
                    at com.isomorphic.autotest.TestRunnerHelper.processSeleniumTests(TestRunnerHelper.java:120)
                    at com.isomorphic.autotest.TestRunnerHelper.testAll(TestRunnerHelper.java:102)
                    at com.isomorphic.autotest.TestRunner.testAll(TestRunner.java:216)
                    at com.isomorphic.autotest.TestRunnerLauncher.launch(TestRunnerLauncher.java:342)
                    at com.isomorphic.autotest.TestRunnerLauncher.launch(TestRunnerLauncher.java:711)
                    at com.isomorphic.autotest.TestRunner.main(TestRunner.java:128)


                    pcocchi
                    We definitely don't get that error. Selenium uses Firefox by default. Do you have Firefox installed? You'll need Firefox 17ESR at the moment since FF22 is incompatible with Selenium (the next Selenium release will resolve this).

                    You should also be able to run with IE, and it was originally tested with IE, but it does appear there are some missing JARs that trigger errors at the moment when IE is used. We'll add these missing JARs for tomorrows build.

                    If you don't have Firefox installed, that's the cause of the error above. If you do, we're not reproducing that. So you can either install FF17ESR (if you don't have Firefox installed) or wait for the next build which should have the JARs to support IE

                    Note that to use IE, you'd need to supply -b "*iexplore" on the command line to test_runner.bat (as the help mentions), or from Java, setBrowser("*iexplore").

                    Comment


                      #11
                      One other possibility. We've seen in the past that Selenium is somtimes picky about the browser specification.

                      You can actually specify the path to your browser with something like:

                      Code:
                      -b "*firefox c:\temp\ff17esr\firefox.exe"
                      This would allow you override a default installation of some browser. There is also the "*firefox3" browser specification which apparently works for some where "*firefox" (our default) does not.

                      The browser setting is something handled by Selenium - we just pass it along without modification.

                      Comment


                        #12
                        I run with Firefox 10, and i run again with Firefox 17 ESR, but i have the same error:

                        C:\Users\pcocchi\Desktop\smartgwtpower-4.0p>test_runner.bat -b "*firefox C:\\firefox17esr\\firefox.exe"

                        .
                        .
                        .

                        Exception in thread "main" java.lang.IllegalArgumentException: resource /customProfileDirCUSTFFCHROME relative to org.openqa.selenium.server.browserlaunchers.FirefoxChromeLauncher not found.
                        at com.google.common.base.Preconditions.checkArgument(Preconditions.java:119)
                        at com.google.common.io.Resources.getResource(Resources.java:169)
                        at org.openqa.selenium.server.browserlaunchers.ResourceExtractor.extractResourcePath(ResourceExtractor.java:51)
                        at org.openqa.selenium.server.browserlaunchers.FirefoxChromeLauncher.extractProfileFromJar(FirefoxChromeLauncher.java:181)
                        at org.openqa.selenium.server.browserlaunchers.FirefoxChromeLauncher.makeCustomProfile(FirefoxChromeLauncher.java:223)
                        at org.openqa.selenium.server.browserlaunchers.FirefoxChromeLauncher.launch(FirefoxChromeLauncher.java:89)
                        at org.openqa.selenium.server.browserlaunchers.FirefoxChromeLauncher.launchHTMLSuite(FirefoxChromeLauncher.java:340)
                        at org.openqa.selenium.server.browserlaunchers.FirefoxLauncher.launchHTMLSuite(FirefoxLauncher.java:110)
                        at org.openqa.selenium.server.htmlrunner.HTMLLauncher.runHTMLSuite(HTMLLauncher.java:145)
                        at org.openqa.selenium.server.htmlrunner.HTMLLauncher.runHTMLSuite(HTMLLauncher.java:71)
                        at com.isomorphic.autotest.TestRunnerHelper.testRctest(TestRunnerHelper.java:256)
                        at com.isomorphic.autotest.TestRunnerHelper.processSeleniumTests(TestRunnerHelper.java:120)
                        at com.isomorphic.autotest.TestRunnerHelper.testAll(TestRunnerHelper.java:102)
                        at com.isomorphic.autotest.TestRunner.testAll(TestRunner.java:216)
                        at com.isomorphic.autotest.TestRunnerLauncher.launch(TestRunnerLauncher.java:342)
                        at com.isomorphic.autotest.TestRunnerLauncher.launch(TestRunnerLauncher.java:711)
                        at com.isomorphic.autotest.TestRunner.main(TestRunner.java:128)


                        I tried with "*firefox3", but similar error:

                        Exception in thread "main" java.lang.IllegalArgumentException: resource /customProfileDirCUSTFFCHROME relative to org.openqa.selenium.server.browserlaunchers.Firefox3Launcher not found.
                        at com.google.common.base.Preconditions.checkArgument(Preconditions.java:119)
                        at com.google.common.io.Resources.getResource(Resources.java:169)
                        at org.openqa.selenium.server.browserlaunchers.ResourceExtractor.extractResourcePath(ResourceExtractor.java:51)
                        at org.openqa.selenium.server.browserlaunchers.FirefoxChromeLauncher.extractProfileFromJar(FirefoxChromeLauncher.java:181)
                        at org.openqa.selenium.server.browserlaunchers.FirefoxChromeLauncher.makeCustomProfile(FirefoxChromeLauncher.java:223)
                        at org.openqa.selenium.server.browserlaunchers.FirefoxChromeLauncher.launch(FirefoxChromeLauncher.java:89)
                        at org.openqa.selenium.server.browserlaunchers.FirefoxChromeLauncher.launchHTMLSuite(FirefoxChromeLauncher.java:340)
                        at org.openqa.selenium.server.htmlrunner.HTMLLauncher.runHTMLSuite(HTMLLauncher.java:145)
                        at org.openqa.selenium.server.htmlrunner.HTMLLauncher.runHTMLSuite(HTMLLauncher.java:71)
                        at com.isomorphic.autotest.TestRunnerHelper.testRctest(TestRunnerHelper.java:256)
                        at com.isomorphic.autotest.TestRunnerHelper.processSeleniumTests(TestRunnerHelper.java:120)
                        at com.isomorphic.autotest.TestRunnerHelper.testAll(TestRunnerHelper.java:102)
                        at com.isomorphic.autotest.TestRunner.testAll(TestRunner.java:216)
                        at com.isomorphic.autotest.TestRunnerLauncher.launch(TestRunnerLauncher.java:342)
                        at com.isomorphic.autotest.TestRunnerLauncher.launch(TestRunnerLauncher.java:711)
                        at com.isomorphic.autotest.TestRunner.main(TestRunner.java:128)


                        I tried with "*iexplore", but again similar error:

                        Exception in thread "main" java.lang.IllegalArgumentException: resource /core relative to org.openqa.selenium.server.browserlaunchers.HTABrowserLauncher not found.
                        at com.google.common.base.Preconditions.checkArgument(Preconditions.java:119)
                        at com.google.common.io.Resources.getResource(Resources.java:169)
                        at org.openqa.selenium.server.browserlaunchers.ResourceExtractor.extractResourcePath(ResourceExtractor.java:51)
                        at org.openqa.selenium.server.browserlaunchers.HTABrowserLauncher.createHTAFiles(HTABrowserLauncher.java:98)
                        at org.openqa.selenium.server.browserlaunchers.HTABrowserLauncher.launch(HTABrowserLauncher.java:80)
                        at org.openqa.selenium.server.browserlaunchers.HTABrowserLauncher.launchHTMLSuite(HTABrowserLauncher.java:160)
                        at org.openqa.selenium.server.browserlaunchers.InternetExplorerLauncher.launchHTMLSuite(InternetExplorerLauncher.java:81)
                        at org.openqa.selenium.server.htmlrunner.HTMLLauncher.runHTMLSuite(HTMLLauncher.java:145)
                        at org.openqa.selenium.server.htmlrunner.HTMLLauncher.runHTMLSuite(HTMLLauncher.java:71)
                        at com.isomorphic.autotest.TestRunnerHelper.testRctest(TestRunnerHelper.java:256)
                        at com.isomorphic.autotest.TestRunnerHelper.processSeleniumTests(TestRunnerHelper.java:120)
                        at com.isomorphic.autotest.TestRunnerHelper.testAll(TestRunnerHelper.java:102)
                        at com.isomorphic.autotest.TestRunner.testAll(TestRunner.java:216)
                        at com.isomorphic.autotest.TestRunnerLauncher.launch(TestRunnerLauncher.java:342)
                        at com.isomorphic.autotest.TestRunnerLauncher.launch(TestRunnerLauncher.java:711)
                        at com.isomorphic.autotest.TestRunner.main(TestRunner.java:128)


                        I looked into "lib\selenium-server-2.26.0.jar", "/core" and "/customProfileDirCUSTFFCHROME" folders are in this jar.
                        The problem is that it does not find them. What is the reason?

                        Thanks for your help.

                        pcocchi
                        Last edited by pcocchi; 25 Jul 2013, 06:24.

                        Comment


                          #13
                          This looks a lot like this error reported on the Selenium website: http://code.google.com/p/selenium/issues/detail?id=1242

                          I'm sure you understand we have no control over bugs in Selenium itself. You might try downloading the latest Selenium JAR from here: https://selenium.googlecode.com/file...ver-2.33.0.zip, and replacing lib\selenium-server-2.26.0.jar with lib\selenium-server-2.33.0.jar in your SGWT installation. (Since 2.26 has been stable in our use cases, it doesn't make sense for us to risk other instabilities by updating unless it solves a known issue.)

                          Comment


                            #14
                            Ok, this was the problem. With the new selenium-server-2.33.0.jar test_runner.bat successfully runs.


                            C:\Users\pcocchi\Desktop\smartgwtpower-4.0p>test_runner.bat

                            Using user-defined JAVA_HOME: "C:\Program Files\Java\jre6"

                            "Installing schema ds.xml files..."
                            1 directory spostata/e.
                            ISC: Configuring log4j from: file:/C:/Users/pcocchi/Desktop/smartgwtpower-4.0p/samples/showcase/war/WEB-INF/classes/log4j.isc.config.xml
                            === 2013-07-25 17:29:27,634 [main] INFO ISCInit - Isomorphic SmartClient/SmartGWT Framework - Initializing
                            === 2013-07-25 17:29:27,639 [main] INFO ConfigLoader - Attempting to load framework.properties from CLASSPATH
                            === 2013-07-25 17:29:27,734 [main] INFO ConfigLoader - Successfully loaded framework.properties from CLASSPATH at location: jar:file:/C:/Users/pcocchi/Desktop/smartgwtpower-4.0p/lib/isomorphic_core_r
                            pc.jar!/framework.properties
                            === 2013-07-25 17:29:27,734 [main] INFO ConfigLoader - Attempting to load project.properties from CLASSPATH
                            === 2013-07-25 17:29:27,735 [main] INFO ConfigLoader - Unable to locate project.properties in CLASSPATH
                            === 2013-07-25 17:29:27,740 [main] INFO ConfigLoader - Successfully loaded isc_interfaces.properties from CLASSPATH at location: jar:file:/C:/Users/pcocchi/Desktop/smartgwtpower-4.0p/lib/isomorphic_c
                            ore_rpc.jar!/isc_interfaces.properties
                            === 2013-07-25 17:29:27,740 [main] INFO ConfigLoader - Attempting to load server.properties from CLASSPATH
                            === 2013-07-25 17:29:27,747 [main] INFO ConfigLoader - Successfully loaded server.properties from CLASSPATH at location: file:/C:/Users/pcocchi/Desktop/smartgwtpower-4.0p/selenium/server.properties
                            === 2013-07-25 17:29:27,754 [main] INFO Logger - Logging system started.
                            === 2013-07-25 17:29:27,755 [main] INFO ISCInit - No ServletContext available yet - using container IO for now
                            === 2013-07-25 17:29:27,757 [main] INFO ISCInit - Isomorphic SmartClient/SmartGWT Framework (v9.0p_2013-07-20/PowerEdition Deployment 2013-07-20) - Initialization Complete
                            === 2013-07-25 17:29:27,775 [main] INFO TestRunnerConfiguration - Setting fileRoot as C:/Users/pcocchi/Desktop/smartgwtpower-4.0p
                            === 2013-07-25 17:29:27,797 [main] INFO ISCInit - No ServletContext available yet - using container IO for now
                            === 2013-07-25 17:29:27,844 [main] DEBUG XML - Parsed XML from C:\Users\pcocchi\Desktop\smartgwtpower-4.0p\showcase\sc\system\schema\builtinTypes.xml: 7ms
                            === 2013-07-25 17:29:27,871 [main] INFO PoolManager - SmartClient pooling started for 'simpleTypes' objects
                            === 2013-07-25 17:29:27,948 [main] DEBUG XML - Parsed XML from C:\Users\pcocchi\Desktop\smartgwtpower-4.0p\selenium\batchRun.ds.xml: 3ms
                            === 2013-07-25 17:29:27,955 [main] DEBUG XML - Parsed XML from C:\Users\pcocchi\Desktop\smartgwtpower-4.0p\showcase\sc\system\schema\DataSource.ds.xml: 6ms
                            === 2013-07-25 17:29:28,027 [main] DEBUG XML - Parsed XML from C:\Users\pcocchi\Desktop\smartgwtpower-4.0p\showcase\sc\system\schema\DataSourceField.ds.xml: 6ms
                            === 2013-07-25 17:29:28,076 [main] DEBUG XML - Parsed XML from C:\Users\pcocchi\Desktop\smartgwtpower-4.0p\showcase\sc\system\schema\OperationBinding.ds.xml: 4ms
                            === 2013-07-25 17:29:28,130 [main] DEBUG DSRequest - Caching instance 9 of DS batchRun from DSRequest.getDataSource()
                            === 2013-07-25 17:29:28,134 [main] DEBUG DeclarativeSecurity - Processing security checks for DataSource null, field null
                            === 2013-07-25 17:29:28,139 [main] DEBUG AppBase - [builtinApplication.null] No userTypes defined, allowing anyone access to all operations for this application
                            === 2013-07-25 17:29:28,140 [main] DEBUG AppBase - [builtinApplication.null] No public zero-argument method named '_null' found, performing generic datasource operation
                            === 2013-07-25 17:29:28,143 [main] INFO SQLDataSource - [builtinApplication.null] Performing add operation with
                            criteria: {branch:"MAIN",batchStartTime:new Date(1374766167000),log:null,user:null} values: {branch:"MAIN",batchStartTime:new Date(1374766167000),log:null,user:null}
                            === 2013-07-25 17:29:28,146 [main] DEBUG SQLValuesClause - [builtinApplication.null] Sequences: {id=__default}
                            log4j:WARN No appenders could be found for logger (org.apache.Velocity).
                            log4j:WARN Please initialize the log4j system properly.
                            === 2013-07-25 17:29:28,238 [main] WARN SQLDriver - [builtinApplication.null] DSRequest has no RPCManager set when testing if we should join a transaction - transaction will not be joined
                            === 2013-07-25 17:29:28,278 [main] INFO PoolManager - [builtinApplication.null] SmartClient pooling started for 'DB2' objects
                            === 2013-07-25 17:29:28,278 [main] DEBUG PoolableSQLConnectionFactory - [builtinApplication.null] Initializing SQL config for 'DB2' from system config - using DataSource: com.ibm.as400.access.AS400JD
                            BCConnectionPoolDataSource
                            === 2013-07-25 17:29:28,343 [main] INFO DataTools - [builtinApplication.null] setProperties: couldn't set:
                            {
                            portNumber:"No such property"
                            }
                            === 2013-07-25 17:29:28,467 [main] DEBUG PoolableSQLConnectionFactory - [builtinApplication.null] makeObject() created a pooled Connection '2128911821'
                            === 2013-07-25 17:29:28,471 [main] DEBUG SQLConnectionManager - [builtinApplication.null] Borrowed connection '2128911821'
                            === 2013-07-25 17:29:28,471 [main] DEBUG SQLDriver - [builtinApplication.null] About to execute SQL update in 'DB2' using connection'2128911821'
                            === 2013-07-25 17:29:28,471 [main] INFO SQLDriver - [builtinApplication.null] Executing SQL update on 'DB2': INSERT INTO batchRun (batchStartTime, branch, log, user) VALUES ('2013-07-25 17:29:27', 'M
                            AIN', NULL, NULL)
                            === 2013-07-25 17:29:28,748 [main] DEBUG SQLDataSource - [builtinApplication.null] add operation affected 1 rows
                            === 2013-07-25 17:29:28,748 [main] INFO SQLDataSource - [builtinApplication.null] primaryKeys: {}
                            === 2013-07-25 17:29:28,749 [main] DEBUG DeclarativeSecurity - [builtinApplication.null] Processing security checks for DataSource null, field null
                            === 2013-07-25 17:29:28,749 [main] DEBUG AppBase - [builtinApplication.null, builtinApplication.null] No userTypes defined, allowing anyone access to all operations for this application
                            === 2013-07-25 17:29:28,750 [main] DEBUG AppBase - [builtinApplication.null, builtinApplication.null] No public zero-argument method named '_null' found, performing generic datasource operation
                            === 2013-07-25 17:29:28,751 [main] INFO SQLDataSource - [builtinApplication.null, builtinApplication.null] Performing fetch operation with
                            criteria: {} values: {}
                            === 2013-07-25 17:29:28,762 [main] INFO SQLWhereClause - [builtinApplication.null, builtinApplication.null] empty condition
                            === 2013-07-25 17:29:28,763 [main] INFO SQLDataSource - [builtinApplication.null, builtinApplication.null] derived query: SELECT $defaultSelectClause FROM $defaultTableClause WHERE $defaultWhereClaus
                            e
                            === 2013-07-25 17:29:28,764 [main] INFO SQLDataSource - [builtinApplication.null, builtinApplication.null] 9: Executing SQL query on 'DB2': SELECT batchRun.batchEndTime, batchRun.batchStartTime, batc
                            hRun.branch, batchRun.id, batchRun.log, batchRun.user FROM batchRun WHERE ('1'='1')
                            === 2013-07-25 17:29:28,765 [main] DEBUG SQLDriver - [builtinApplication.null, builtinApplication.null] About to execute SQL query in 'DB2' using connection '2128911821'
                            === 2013-07-25 17:29:28,765 [main] INFO SQLDriver - [builtinApplication.null, builtinApplication.null] Executing SQL query on 'DB2': SELECT batchRun.batchEndTime, batchRun.batchStartTime, batchRun.br
                            anch, batchRun.id, batchRun.log, batchRun.user FROM batchRun WHERE ('1'='1')
                            === 2013-07-25 17:29:28,855 [main] INFO DSResponse - [builtinApplication.null, builtinApplication.null] DSResponse: List with 87 items
                            === 2013-07-25 17:29:28,856 [main] INFO DSResponse - [builtinApplication.null] DSResponse: List with 87 items
                            === 2013-07-25 17:29:28,856 [main] DEBUG SQLDriver - Freeing SQLDriver dbConnection 2128911821
                            === 2013-07-25 17:29:28,859 [main] DEBUG SQLConnectionManager - About to close PoolableConnection with hashcode "2128911821"
                            === 2013-07-25 17:29:29,161 [main] INFO SeleniumServerHelper - Selenium server started
                            jar:file:/C:/Users/pcocchi/Desktop/smartgwtpower-4.0p/lib/selenium-server-2.33.0.jar!/customProfileDirCUSTFFCHROME
                            17:29:29.260 INFO - Preparing Firefox profile...
                            17:29:32.712 INFO - Launching Firefox...
                            17:29:35.776 INFO - Checking Resource aliases
                            17:30:18.211 INFO - Killing Firefox...
                            === 2013-07-25 17:30:18,346 [main] INFO TestRunner - results for sqlConnector-1.rctest.html:
                            === 2013-07-25 17:30:18,346 [main] ERROR TestRunner - error:TestCase results have not appeared after 45 seconds
                            === 2013-07-25 17:30:18,586 [main] INFO SeleniumServerHelper - Selenium server stopped
                            === 2013-07-25 17:30:18,591 [main] DEBUG XML - Parsed XML from C:\Users\pcocchi\Desktop\smartgwtpower-4.0p\selenium\testResult.ds.xml: 3ms
                            === 2013-07-25 17:30:18,603 [main] DEBUG DSRequest - Caching instance 12 of DS testResult from DSRequest.getDataSource()
                            === 2013-07-25 17:30:18,604 [main] DEBUG DeclarativeSecurity - Processing security checks for DataSource null, field null
                            === 2013-07-25 17:30:18,604 [main] DEBUG AppBase - [builtinApplication.null] No userTypes defined, allowing anyone access to all operations for this application
                            === 2013-07-25 17:30:18,605 [main] DEBUG AppBase - [builtinApplication.null] No public zero-argument method named '_null' found, performing generic datasource operation
                            === 2013-07-25 17:30:18,607 [main] INFO SQLDataSource - [builtinApplication.null] Performing add operation with
                            criteria: {startTime:new Date(1374766169180),result:"timeout",details:"TestCase results have not appeared after 45 seconds",description:null,branch:"MAIN",batchStartTime:new Date(1374766167000
                            ),endTime:new Date(1374766218345),messages:null,testFile:"sqlConnector-1.rctest.html"} values: {startTime:new Date(1374766169180),result:"timeout",details:"TestCase results have not appeared after 45
                            seconds",description:null,branch:"MAIN",batchStartTime:new Date(1374766167000),endTime:new Date(1374766218345),messages:null,testFile:"sqlConnector-1.rctest.html"}
                            === 2013-07-25 17:30:18,608 [main] INFO SQLValuesClause - [builtinApplication.null] Ignored data for non-existent or included columns: [description]
                            === 2013-07-25 17:30:18,608 [main] DEBUG SQLValuesClause - [builtinApplication.null] Sequences: {}
                            === 2013-07-25 17:30:18,612 [main] WARN SQLDriver - [builtinApplication.null] DSRequest has no RPCManager set when testing if we should join a transaction - transaction will not be joined
                            === 2013-07-25 17:30:18,612 [main] DEBUG SQLConnectionManager - [builtinApplication.null] Borrowed connection '2128911821'
                            === 2013-07-25 17:30:18,613 [main] DEBUG SQLDriver - [builtinApplication.null] About to execute SQL update in 'DB2' using connection'2128911821'
                            === 2013-07-25 17:30:18,614 [main] INFO SQLDriver - [builtinApplication.null] Executing SQL update on 'DB2': INSERT INTO testResult (batchStartTime, branch, details, endTime, messages, result, startT
                            ime, testFile) VALUES ('2013-07-25 17:29:27', 'MAIN', 'TestCase results have not appeared after 45 seconds', '2013-07-25 17:30:18', NULL, 'timeout', '2013-07-25 17:29:29', 'sqlConnector-1.rctest.html'
                            )
                            === 2013-07-25 17:30:18,791 [main] DEBUG SQLDataSource - [builtinApplication.null] add operation affected 1 rows
                            === 2013-07-25 17:30:18,792 [main] DEBUG SQLDriver - Freeing SQLDriver dbConnection 2128911821
                            === 2013-07-25 17:30:18,792 [main] DEBUG SQLConnectionManager - About to close PoolableConnection with hashcode "2128911821"
                            === 2013-07-25 17:30:18,796 [main] DEBUG DSRequest - Caching instance 9 of DS batchRun from DSRequest.getDataSource()
                            === 2013-07-25 17:30:18,797 [main] DEBUG DeclarativeSecurity - Processing security checks for DataSource null, field null
                            === 2013-07-25 17:30:18,798 [main] DEBUG AppBase - [builtinApplication.null] No userTypes defined, allowing anyone access to all operations for this application
                            === 2013-07-25 17:30:18,798 [main] DEBUG AppBase - [builtinApplication.null] No public zero-argument method named '_null' found, performing generic datasource operation
                            === 2013-07-25 17:30:18,800 [main] INFO SQLDataSource - [builtinApplication.null] Performing update operation with
                            criteria: {batchStartTime:new Date(1374766167000)} values: {batchEndTime:new Date(1374766218796)}
                            === 2013-07-25 17:30:18,802 [main] WARN SQLDriver - [builtinApplication.null] DSRequest has no RPCManager set when testing if we should join a transaction - transaction will not be joined
                            === 2013-07-25 17:30:18,803 [main] DEBUG SQLConnectionManager - [builtinApplication.null] Borrowed connection '2128911821'
                            === 2013-07-25 17:30:18,803 [main] DEBUG SQLDriver - [builtinApplication.null] About to execute SQL update in 'DB2' using connection'2128911821'
                            === 2013-07-25 17:30:18,804 [main] INFO SQLDriver - [builtinApplication.null] Executing SQL update on 'DB2': UPDATE batchRun SET batchEndTime='2013-07-25 17:30:18' WHERE (batchRun.batchStartTime='201
                            3-07-25 17:29:27')
                            === 2013-07-25 17:30:18,861 [main] DEBUG SQLDataSource - [builtinApplication.null] update operation affected 1 rows
                            === 2013-07-25 17:30:18,861 [main] DEBUG SQLDriver - Freeing SQLDriver dbConnection 2128911821
                            === 2013-07-25 17:30:18,862 [main] DEBUG SQLConnectionManager - About to close PoolableConnection with hashcode "2128911821"


                            I tried to override "selenium-server-2.33.0.jar" into my java project to run from servlet, but i still have the old behaviour, no "*.rctest.html" file is processed.


                            pcocchi
                            Last edited by pcocchi; 25 Jul 2013, 07:51.

                            Comment


                              #15
                              OK. Selenium 2.34 should be released soon and will solve the Firefox 22 issues so that was definitely going to get pushed, but we'll go ahead and bump it to 2.33 now since your experience shows there are real cases in the field where 2.26 fails.

                              Comment

                              Working...
                              X