2010-04-21 11:39:19.902 java[7113:a07] [Java CocoaComponent compatibility mode]: Enabled
2010-04-21 11:39:19.905 java[7113:a07] [Java CocoaComponent compatibility mode]: Setting timeout for SWT to 0.100000
0    [Thread-0] DEBUG org.apache.jasper.compiler.JspRuntimeContext  - Parent class loader is: ContextLoader@null
3    [Thread-0] DEBUG org.apache.jasper.servlet.JspServlet  - Scratch dir for the JSP engine is: /var/folders/Lw/LwppXX9DFzOf6L5E-CEtUE+++TI/-Tmp-/Jetty_0_0_0_0_8888_war____masbuh/jsp
3    [Thread-0] DEBUG org.apache.jasper.servlet.JspServlet  - IMPORTANT: Do not modify the generated servlets
ISC: Configuring log4j from: file:/Users/macinp/Documents/GT/Clients/sigh/Dev/tracker-dev/workspace/Tracker/war/WEB-INF/classes/log4j.isc.config.xml
=== 2010-04-21 11:39:21,773 [ad-0] INFO  ISCInit - Isomorphic SmartClient Framework - Initializing
=== 2010-04-21 11:39:21,878 [ad-0] INFO  ConfigLoader - Attempting to load framework.properties from CLASSPATH
=== 2010-04-21 11:39:21,936 [ad-0] INFO  ConfigLoader - Successfully loaded framework.properties from CLASSPATH at location: jar:file:/Users/macinp/Documents/GT/Clients/sigh/Dev/tracker-dev/workspace/Tracker/war/WEB-INF/lib/isomorphic_core_rpc.jar!/framework.properties
=== 2010-04-21 11:39:21,936 [ad-0] INFO  ConfigLoader - Attempting to load project.properties from CLASSPATH
=== 2010-04-21 11:39:21,937 [ad-0] INFO  ConfigLoader - Unable to locate project.properties in CLASSPATH
=== 2010-04-21 11:39:21,940 [ad-0] INFO  ConfigLoader - Successfully loaded isc_interfaces.properties from CLASSPATH at location: jar:file:/Users/macinp/Documents/GT/Clients/sigh/Dev/tracker-dev/workspace/Tracker/war/WEB-INF/lib/isomorphic_core_rpc.jar!/isc_interfaces.properties
=== 2010-04-21 11:39:21,940 [ad-0] INFO  ConfigLoader - Attempting to load server.properties from CLASSPATH
=== 2010-04-21 11:39:21,941 [ad-0] INFO  ConfigLoader - Successfully loaded server.properties from CLASSPATH at location: file:/Users/macinp/Documents/GT/Clients/sigh/Dev/tracker-dev/workspace/Tracker/war/WEB-INF/classes/server.properties
=== 2010-04-21 11:39:21,948 [ad-0] INFO  Logger - Logging system started.
=== 2010-04-21 11:39:21,949 [ad-0] INFO  ISCInit - Isomorphic SmartClient Framework (SC_SNAPSHOT-2010-03-09/EVAL Deployment 2010-03-09) - Initialization Complete
=== 2010-04-21 11:39:21,951 [ad-0] INFO  ISCInit - Auto-detected webRoot - using: /Users/macinp/Documents/GT/Clients/sigh/Dev/tracker-dev/workspace/Tracker/war
=== 2010-04-21 11:39:22,087 [ad-0] INFO  PreCache - Isomorphic PreCache servlet loading
=== 2010-04-21 11:39:22,106 [ad-0] INFO  PoolManager - SmartClient pooling disabled for 'DataSource' objects
=== 2010-04-21 11:39:22,160 [ad-0] DEBUG XML - Parsed XML from /Users/macinp/Documents/GT/Clients/sigh/Dev/tracker-dev/workspace/Tracker/war/tracker/sc/system/schema/DataSource.ds.xml: 8ms
=== 2010-04-21 11:39:22,168 [ad-0] DEBUG XML - Parsed XML from /Users/macinp/Documents/GT/Clients/sigh/Dev/tracker-dev/workspace/Tracker/war/tracker/sc/system/schema/builtinTypes.xml: 4ms
=== 2010-04-21 11:39:22,233 [ad-0] DEBUG XML - Parsed XML from /Users/macinp/Documents/GT/Clients/sigh/Dev/tracker-dev/workspace/Tracker/war/tracker/sc/system/schema/DataSourceField.ds.xml: 4ms
=== 2010-04-21 11:39:22,249 [ad-0] DEBUG XML - Parsed XML from /Users/macinp/Documents/GT/Clients/sigh/Dev/tracker-dev/workspace/Tracker/war/tracker/sc/system/schema/Validator.ds.xml: 2ms
=== 2010-04-21 11:39:22,258 [ad-0] DEBUG XML - Parsed XML from /Users/macinp/Documents/GT/Clients/sigh/Dev/tracker-dev/workspace/Tracker/war/tracker/sc/system/schema/ValueMap.ds.xml: 1ms
=== 2010-04-21 11:39:22,264 [ad-0] DEBUG XML - Parsed XML from /Users/macinp/Documents/GT/Clients/sigh/Dev/tracker-dev/workspace/Tracker/war/tracker/sc/system/schema/InstantDataApp.ds.xml: 4ms
=== 2010-04-21 11:39:22,309 [ad-0] DEBUG XML - Parsed XML from /Users/macinp/Documents/GT/Clients/sigh/Dev/tracker-dev/workspace/Tracker/war/tracker/sc/system/schema/Application.ds.xml: 2ms
=== 2010-04-21 11:39:22,312 [ad-0] DEBUG XML - Parsed XML from /Users/macinp/Documents/GT/Clients/sigh/Dev/tracker-dev/workspace/Tracker/war/tracker/sc/system/schema/IDAPage.ds.xml: 1ms
=== 2010-04-21 11:39:22,316 [ad-0] DEBUG XML - Parsed XML from /Users/macinp/Documents/GT/Clients/sigh/Dev/tracker-dev/workspace/Tracker/war/tracker/sc/system/schema/IDAUserType.ds.xml: 1ms
=== 2010-04-21 11:39:22,326 [ad-0] DEBUG XML - Parsed XML from /Users/macinp/Documents/GT/Clients/sigh/Dev/tracker-dev/workspace/Tracker/war/tracker/sc/system/schema/IDAOperation.ds.xml: 2ms
=== 2010-04-21 11:39:22,345 [ad-0] DEBUG XML - Parsed XML from /Users/macinp/Documents/GT/Clients/sigh/Dev/tracker-dev/workspace/Tracker/war/tracker/sc/system/schema/Canvas.ds.xml: 9ms
=== 2010-04-21 11:39:22,382 [ad-0] DEBUG XML - Parsed XML from /Users/macinp/Documents/GT/Clients/sigh/Dev/tracker-dev/workspace/Tracker/war/tracker/sc/system/schema/MethodDeclaration.ds.xml: 2ms
=== 2010-04-21 11:39:22,389 [ad-0] DEBUG XML - Parsed XML from /Users/macinp/Documents/GT/Clients/sigh/Dev/tracker-dev/workspace/Tracker/war/tracker/sc/system/schema/Img.ds.xml: 1ms
=== 2010-04-21 11:39:22,398 [ad-0] DEBUG XML - Parsed XML from /Users/macinp/Documents/GT/Clients/sigh/Dev/tracker-dev/workspace/Tracker/war/tracker/sc/system/schema/StatefulCanvas.ds.xml: 3ms
=== 2010-04-21 11:39:22,416 [ad-0] DEBUG XML - Parsed XML from /Users/macinp/Documents/GT/Clients/sigh/Dev/tracker-dev/workspace/Tracker/war/tracker/sc/system/schema/Button.ds.xml: 2ms
=== 2010-04-21 11:39:22,422 [ad-0] DEBUG XML - Parsed XML from /Users/macinp/Documents/GT/Clients/sigh/Dev/tracker-dev/workspace/Tracker/war/tracker/sc/system/schema/ListViewer.ds.xml: 1ms
=== 2010-04-21 11:39:22,428 [ad-0] DEBUG XML - Parsed XML from /Users/macinp/Documents/GT/Clients/sigh/Dev/tracker-dev/workspace/Tracker/war/tracker/sc/system/schema/ListGrid.ds.xml: 5ms
=== 2010-04-21 11:39:22,448 [ad-0] DEBUG XML - Parsed XML from /Users/macinp/Documents/GT/Clients/sigh/Dev/tracker-dev/workspace/Tracker/war/tracker/sc/system/schema/DynamicForm.ds.xml: 2ms
=== 2010-04-21 11:39:22,457 [ad-0] DEBUG XML - Parsed XML from /Users/macinp/Documents/GT/Clients/sigh/Dev/tracker-dev/workspace/Tracker/war/tracker/sc/system/schema/FormItem.ds.xml: 2ms
=== 2010-04-21 11:39:22,476 [ad-0] DEBUG XML - Parsed XML from /Users/macinp/Documents/GT/Clients/sigh/Dev/tracker-dev/workspace/Tracker/war/tracker/sc/system/schema/DetailViewer.ds.xml: 2ms
=== 2010-04-21 11:39:22,481 [ad-0] DEBUG XML - Parsed XML from /Users/macinp/Documents/GT/Clients/sigh/Dev/tracker-dev/workspace/Tracker/war/tracker/sc/system/schema/DetailViewerField.ds.xml: 1ms
=== 2010-04-21 11:39:22,485 [ad-0] DEBUG XML - Parsed XML from /Users/macinp/Documents/GT/Clients/sigh/Dev/tracker-dev/workspace/Tracker/war/tracker/sc/system/schema/isomorphicXML.ds.xml: 1ms
=== 2010-04-21 11:39:22,489 [ad-0] INFO  PreCache - Isomorphic PreCache complete (401ms)
Loading modules
   com.sigh.tracker.Tracker
      Loading inherited module 'com.allen_sauer.gwt.log.gwt-log-OFF'
         Loading inherited module 'com.allen_sauer.gwt.log.gwt-log-common'
            [WARN] Setting configuration property named log_pattern in com.allen_sauer.gwt.log.gwt-log-common that has not been previously defined.  This may be disallowed in the future.
=== 2010-04-21 11:39:49,007 [l0-0] DEBUG XML - Parsed XML from (in memory stream): 4ms
=== 2010-04-21 11:39:49,072 [l0-0] DEBUG XML - Parsed XML from (in memory stream): 1ms
============= gwt-log-2.6.2 =============Wed Apr 21 11:40:21 EDT 2010=============
=== 2010-04-21 11:40:25,326 [l0-6] INFO  RequestContext - URL: '/tracker/sc/IDACall', User-Agent: 'Mozilla/5.0 (Macintosh; U; Intel Mac OS X 10_6_3; en-us) AppleWebKit/531.22.7 (KHTML, like Gecko) Version/4.0.5 Safari/531.22.7': Safari with Accept-Encoding header
=== 2010-04-21 11:40:25,326 [l0-2] INFO  RequestContext - URL: '/tracker/sc/IDACall', User-Agent: 'Mozilla/5.0 (Macintosh; U; Intel Mac OS X 10_6_3; en-us) AppleWebKit/531.22.7 (KHTML, like Gecko) Version/4.0.5 Safari/531.22.7': Safari with Accept-Encoding header
=== 2010-04-21 11:40:25,350 [l0-2] DEBUG XML - Parsed XML from (in memory stream): 4ms
=== 2010-04-21 11:40:25,350 [l0-6] DEBUG XML - Parsed XML from (in memory stream): 3ms
=== 2010-04-21 11:40:25,354 [l0-6] DEBUG XML - Parsed XML from /Users/macinp/Documents/GT/Clients/sigh/Dev/tracker-dev/workspace/Tracker/war/tracker/sc/system/schema/List.ds.xml: 3ms
=== 2010-04-21 11:40:25,360 [l0-2] DEBUG XML - Parsed XML from /Users/macinp/Documents/GT/Clients/sigh/Dev/tracker-dev/workspace/Tracker/war/tracker/sc/system/schema/List.ds.xml: 6ms
=== 2010-04-21 11:40:25,360 [l0-6] DEBUG RPCManager - Processing 1 requests.
=== 2010-04-21 11:40:25,362 [l0-2] DEBUG RPCManager - Processing 2 requests.
=== 2010-04-21 11:40:25,368 [l0-2] DEBUG RPCManager - Request #1 (DSRequest) payload: {
    criteria:{
    },
    operationConfig:{
        dataSource:"Element",
        operationType:"fetch",
        textMatchStyle:"substring"
    },
    startRow:0,
    endRow:75,
    sortBy:[
        "Name"
    ],
    componentId:"isc_OID_49",
    appID:"builtinApplication",
    operation:"Element_fetch",
    oldValues:{
    }
}
=== 2010-04-21 11:40:25,368 [l0-6] DEBUG RPCManager - Request #1 (DSRequest) payload: {
    criteria:{
    },
    operationConfig:{
        dataSource:"ElementType",
        operationType:"fetch",
        textMatchStyle:"startsWith"
    },
    startRow:0,
    endRow:75,
    componentId:"isc_PickListMenu_0",
    appID:"builtinApplication",
    operation:"ElementType_fetch",
    oldValues:{
    }
}
=== 2010-04-21 11:40:25,370 [l0-2] DEBUG RPCManager - Request #2 (DSRequest) payload: {
    operationConfig:{
        dataSource:"ElementType",
        operationType:"fetch"
    },
    appID:"builtinApplication",
    operation:"ElementType_fetch",
    criteria:{
    }
}
=== 2010-04-21 11:40:25,379 [l0-6] DEBUG XML - Parsed XML from (in memory stream): 4ms
=== 2010-04-21 11:40:25,379 [l0-2] DEBUG XML - Parsed XML from (in memory stream): 4ms
=== 2010-04-21 11:40:25,395 [l0-6] DEBUG AppBase - [builtinApplication.ElementType_fetch] No userTypes defined, allowing anyone access to all operations for this application
=== 2010-04-21 11:40:25,395 [l0-2] DEBUG AppBase - [builtinApplication.Element_fetch] No userTypes defined, allowing anyone access to all operations for this application
=== 2010-04-21 11:40:25,396 [l0-2] DEBUG AppBase - [builtinApplication.Element_fetch] No public zero-argument method named '_Element_fetch' found, performing generic datasource operation
=== 2010-04-21 11:40:25,396 [l0-6] DEBUG AppBase - [builtinApplication.ElementType_fetch] No public zero-argument method named '_ElementType_fetch' found, performing generic datasource operation
=== 2010-04-21 11:40:25,397 [l0-2] INFO  SQLDataSource - [builtinApplication.Element_fetch] Performing fetch operation with
	criteria: {}	values: {}
=== 2010-04-21 11:40:25,397 [l0-6] INFO  SQLDataSource - [builtinApplication.ElementType_fetch] Performing fetch operation with
	criteria: {}	values: {}
=== 2010-04-21 11:40:25,407 [l0-6] INFO  SQLWhereClause - [builtinApplication.ElementType_fetch] empty condition
=== 2010-04-21 11:40:25,408 [l0-2] INFO  SQLWhereClause - [builtinApplication.Element_fetch] empty condition
=== 2010-04-21 11:40:25,409 [l0-6] INFO  SQLDataSource - [builtinApplication.ElementType_fetch] derived query: SELECT $defaultSelectClause FROM $defaultTableClause WHERE $defaultWhereClause
=== 2010-04-21 11:40:25,409 [l0-2] INFO  SQLDataSource - [builtinApplication.Element_fetch] derived query: SELECT $defaultSelectClause FROM $defaultTableClause WHERE $defaultWhereClause ORDER BY $defaultOrderClause
63766 [btpool0-6] DEBUG org.apache.Velocity  - SimpleLog4JLogSystem using category 'org.apache.Velocity'
63766 [btpool0-6] DEBUG org.apache.Velocity  - *******************************************************************
63766 [btpool0-6] DEBUG org.apache.Velocity  - Starting Apache Velocity v1.6.1 (compiled: 2008-12-09 10:57:23)
63766 [btpool0-6] DEBUG org.apache.Velocity  - RuntimeInstance initializing.
63766 [btpool0-6] DEBUG org.apache.Velocity  - Default Properties File: org/apache/velocity/runtime/defaults/velocity.properties
63767 [btpool0-6] DEBUG org.apache.Velocity  - Trying to use logger class org.apache.velocity.runtime.log.SimpleLog4JLogSystem
63767 [btpool0-6] DEBUG org.apache.Velocity  - LogSystem has been deprecated. Please use a LogChute implementation.
63772 [btpool0-6] DEBUG org.apache.Velocity  - Default ResourceManager initializing. (class org.apache.velocity.runtime.resource.ResourceManagerImpl)
63778 [btpool0-6] DEBUG org.apache.Velocity  - ResourceLoader instantiated: org.apache.velocity.runtime.resource.loader.FileResourceLoader
63780 [btpool0-6] DEBUG org.apache.Velocity  - FileResourceLoader : initialization starting.
63780 [btpool0-6] DEBUG org.apache.Velocity  - Do unicode file recognition:  false
63780 [btpool0-6] DEBUG org.apache.Velocity  - FileResourceLoader : adding path ''
63780 [btpool0-6] DEBUG org.apache.Velocity  - FileResourceLoader : initialization complete.
63790 [btpool0-6] DEBUG org.apache.Velocity  - ResourceCache: initialized (class org.apache.velocity.runtime.resource.ResourceCacheImpl) with class java.util.Collections$SynchronizedMap cache map.
63790 [btpool0-6] DEBUG org.apache.Velocity  - Default ResourceManager initialization complete.
63833 [btpool0-6] DEBUG org.apache.Velocity  - Loaded System Directive: org.apache.velocity.runtime.directive.Define
63853 [btpool0-6] DEBUG org.apache.Velocity  - Loaded System Directive: org.apache.velocity.runtime.directive.Break
63862 [btpool0-6] DEBUG org.apache.Velocity  - Loaded System Directive: org.apache.velocity.runtime.directive.Evaluate
63873 [btpool0-6] DEBUG org.apache.Velocity  - Loaded System Directive: org.apache.velocity.runtime.directive.Literal
63893 [btpool0-6] DEBUG org.apache.Velocity  - Loaded System Directive: org.apache.velocity.runtime.directive.Macro
63895 [btpool0-6] DEBUG org.apache.Velocity  - Loaded System Directive: org.apache.velocity.runtime.directive.Parse
63897 [btpool0-6] DEBUG org.apache.Velocity  - Loaded System Directive: org.apache.velocity.runtime.directive.Include
63899 [btpool0-6] DEBUG org.apache.Velocity  - Loaded System Directive: org.apache.velocity.runtime.directive.Foreach
63930 [btpool0-6] DEBUG org.apache.Velocity  - Created '20' parsers.
63939 [btpool0-6] DEBUG org.apache.Velocity  - Velocimacro : initialization starting.
63939 [btpool0-6] DEBUG org.apache.Velocity  - Velocimacro : "velocimacro.library" is not set.  Trying default library: VM_global_library.vm
63939 [btpool0-6] DEBUG org.apache.Velocity  - Velocimacro : Default library not found.
63939 [btpool0-6] DEBUG org.apache.Velocity  - Velocimacro : allowInline = true : VMs can be defined inline in templates
63940 [btpool0-6] DEBUG org.apache.Velocity  - Velocimacro : allowInlineToOverride = false : VMs defined inline may NOT replace previous VM definitions
63940 [btpool0-6] DEBUG org.apache.Velocity  - Velocimacro : allowInlineLocal = false : VMs defined inline will be global in scope if allowed.
63940 [btpool0-6] DEBUG org.apache.Velocity  - Velocimacro : autoload off : VM system will not automatically reload global library macros
63940 [btpool0-6] DEBUG org.apache.Velocity  - Velocimacro : Velocimacro : initialization complete.
63940 [btpool0-6] DEBUG org.apache.Velocity  - RuntimeInstance successfully initialized.