History | Log In     View a printable version of the current page.  
Issue Details (XML | Word | Printable)

Key: APF-925
Type: Bug Bug
Status: Resolved Resolved
Resolution: Fixed
Priority: Major Major
Assignee: Matt Raible
Reporter: Declan Cox
Votes: 0
Watchers: 1
Operations

If you were logged in you would be able to see more operations.
AppFuse

full-source JPA spring-modular: some tomcat tests failing and 'View Users' and "Current Users" pages blank

Created: 03/Oct/07 06:42 AM   Updated: 24/Oct/07 01:54 AM
Component/s: Build, Test, or Deploy Process, Web - Spring, Installation
Affects Version/s: 2.0 Final
Fix Version/s: 2.0.1

Environment:
Appfuse 2.0, Maven 2.0.7, Windows XP, Firefox 2.0.0.7,
java version "1.6.0_02"
Java(TM) SE Runtime Environment (build 1.6.0_02-b06)
Java HotSpot(TM) Client VM (build 1.6.0_02-b06, mixed mode, sharing)


 Description  « Hide
The two main problems are as follows:

1. Some tomcat tests fail when mvn is run after mvn appfuse:full-source
2. This does not prevent the app from being deployed (as long as tests are skipped) but some pages are rendered black
   specifically userList and activeUsers
   

The following steps are based on http://appfuse.org/display/APF/Using+JPA. There are some slight variations and some additional
information garnered from other issues reported.

   
 
 
 1. Modify main pom.xml - change dao.framework property from 'hibernate' to 'jpa'
    ( I also add a password for mysql since I have secured my local instance)
 2. Modify core pom.xml - change hibernate maven plugin config so that hbm2ddl uses
    'jpaconfiguration' instead of 'annotationconfiguration'
 3. Modify web pom.xml so that cargo plugin uses existing tomcat installation (6.0.14).
    See here http://appfuse.org/display/APF/FAQ#FAQ-useexistingtomcat
    
 4. Run mvn appfuse:full-source
 5. Removed extra persistence.xml files as follows: (see APF-910)
    rm -rf core/src/test/resources/META-INF/persistence.xml
    rm -rf web/src/main/resource/META-INF/persistence.xml
    
 6. Remove hibernate config files from source tree:
     
    find . -name 'hibernate.cfg.xml' -exec rm -f {} ";"
 
 7. run mvn (default goal is install)
 
 Here is a stack trace of the full run. There are a number of exceptions thrown along the way some innocuous enough.
 The spring modules validator related ones are a bit worrying. It seems its due to a maven dependency conflict
 (there are dependencies on two versions of commons-lang 2.1 and 2.3 which seem to be at issue - can't find
 any more info on this).
 
 
 
 Declan Cox@MINDSTORM /cygdrive/c/root/projects/full-source/vas
 $ mvn
 [INFO] Scanning for projects...
 [INFO] Reactor build order:
 [INFO] AppFuse Modular Application
 [INFO] AppFuse Modular Application - Core
 [INFO] AppFuse Modular Application - Web (Spring MVC)
 [INFO] ----------------------------------------------------------------------------
 [INFO] Building AppFuse Modular Application
 [INFO] task-segment: [install]
 [INFO] ----------------------------------------------------------------------------
 [INFO] [site:attach-descriptor]
 [INFO] [install:install]
 [INFO] Installing c:\root\projects\full-source\vas\pom.xml to D:\maven\repository\com\tango\vas\vas\
 1.0-SNAPSHOT\vas-1.0-SNAPSHOT.pom
 [INFO] ----------------------------------------------------------------------------
 [INFO] Building AppFuse Modular Application - Core
 [INFO] task-segment: [install]
 [INFO] ----------------------------------------------------------------------------
 [INFO] [aspectj:compile {execution: default}]
 [WARNING] bad version number found in D:\maven\repository\aspectj\aspectjrt\1.5.3\aspectjrt-1.5.3.ja
 r expected 1.5.2a found 1.5.3
 [INFO] [resources:resources]
 [INFO] Using default encoding to copy filtered resources.
 [INFO] [compiler:compile]
 [INFO] Nothing to compile - all classes are up to date
 [INFO] [resources:testResources]
 [INFO] Using default encoding to copy filtered resources.
 [INFO] Preparing hibernate3:hbm2ddl
 [WARNING] Removing: hbm2ddl from forked lifecycle, to prevent recursive invocation.
 [INFO] [aspectj:compile {execution: default}]
 [INFO] [resources:resources]
 [INFO] Using default encoding to copy filtered resources.
 [WARNING] POM for 'org.hibernate:jtidy:pom:r8-20060801:runtime' is invalid. It will be ignored for a
 rtifact resolution. Reason: Parse error reading POM. Reason: TEXT must be immediately followed by EN
 D_TAG and not START_TAG (position: START_TAG seen ...<licenses>\n\t\t\t<license>... @12:13) for pro
 ject org.hibernate:jtidy at D:\maven\repository\org\hibernate\jtidy\r8-20060801\jtidy-r8-20060801.po
 m
 [WARNING] POM for 'org.hibernate:jtidy:pom:r8-20060801:runtime' is invalid. It will be ignored for a
 rtifact resolution. Reason: Parse error reading POM. Reason: TEXT must be immediately followed by EN
 D_TAG and not START_TAG (position: START_TAG seen ...<licenses>\n\t\t\t<license>... @12:13) for pro
 ject org.hibernate:jtidy at D:\maven\repository\org\hibernate\jtidy\r8-20060801\jtidy-r8-20060801.po
 m
 [INFO] [hibernate3:hbm2ddl {execution: default}]
 [INFO] src/main/resources/hibernate.cfg.xml not found within the project. Trying absolute path.
 [INFO] No hibernate configuration file loaded.
 [INFO] Configuration Properties file loaded: C:\root\projects\full-source\vas\core\target\test-class
 es\jdbc.properties
 alter table user_role drop foreign key FK143BF46A6AAE62D7;
 alter table user_role drop foreign key FK143BF46AFD926B7;
 drop table if exists app_user;
 drop table if exists role;
 drop table if exists user_role;
 create table app_user (id bigint not null auto_increment, address varchar(150), country varchar(100)
 , city varchar(50) not null, province varchar(100), postal_code varchar(15) not null, version intege
 r, password varchar(255) not null, username varchar(50) not null unique, account_enabled bit, email
 varchar(255) not null unique, password_hint varchar(255), first_name varchar(50) not null, last_name
  varchar(50) not null, phone_number varchar(255), website varchar(255), account_expired bit not null
 , account_locked bit not null, credentials_expired bit not null, primary key (id)) type=InnoDB;
 WARN - JDBCExceptionReporter.logWarnings(48) | SQL Warning: 1287, SQLState: HY000
 WARN - JDBCExceptionReporter.logWarnings(49) | 'TYPE=storage_engine' is deprecated; use 'ENGINE=stor
 age_engine' instead
 create table role (id bigint not null auto_increment, name varchar(20), description varchar(64), pri
 mary key (id)) type=InnoDB;
 WARN - JDBCExceptionReporter.logWarnings(48) | SQL Warning: 1287, SQLState: HY000
 WARN - JDBCExceptionReporter.logWarnings(49) | 'TYPE=storage_engine' is deprecated; use 'ENGINE=stor
 age_engine' instead
 WARN - JDBCExceptionReporter.logWarnings(48) | SQL Warning: 1287, SQLState: HY000
 WARN - JDBCExceptionReporter.logWarnings(49) | 'TYPE=storage_engine' is deprecated; use 'ENGINE=stor
 age_engine' instead
 create table user_role (user_id bigint not null, role_id bigint not null, primary key (user_id, role
 _id)) type=InnoDB;
 WARN - JDBCExceptionReporter.logWarnings(48) | SQL Warning: 1287, SQLState: HY000
 WARN - JDBCExceptionReporter.logWarnings(49) | 'TYPE=storage_engine' is deprecated; use 'ENGINE=stor
 age_engine' instead
 WARN - JDBCExceptionReporter.logWarnings(48) | SQL Warning: 1287, SQLState: HY000
 WARN - JDBCExceptionReporter.logWarnings(49) | 'TYPE=storage_engine' is deprecated; use 'ENGINE=stor
 age_engine' instead
 WARN - JDBCExceptionReporter.logWarnings(48) | SQL Warning: 1287, SQLState: HY000
 WARN - JDBCExceptionReporter.logWarnings(49) | 'TYPE=storage_engine' is deprecated; use 'ENGINE=stor
 age_engine' instead
 alter table user_role add index FK143BF46A6AAE62D7 (role_id), add constraint FK143BF46A6AAE62D7 fore
 ign key (role_id) references role (id);
 WARN - JDBCExceptionReporter.logWarnings(48) | SQL Warning: 1287, SQLState: HY000
 WARN - JDBCExceptionReporter.logWarnings(49) | 'TYPE=storage_engine' is deprecated; use 'ENGINE=stor
 age_engine' instead
 WARN - JDBCExceptionReporter.logWarnings(48) | SQL Warning: 1287, SQLState: HY000
 WARN - JDBCExceptionReporter.logWarnings(49) | 'TYPE=storage_engine' is deprecated; use 'ENGINE=stor
 age_engine' instead
 WARN - JDBCExceptionReporter.logWarnings(48) | SQL Warning: 1287, SQLState: HY000
 WARN - JDBCExceptionReporter.logWarnings(49) | 'TYPE=storage_engine' is deprecated; use 'ENGINE=stor
 age_engine' instead
 alter table user_role add index FK143BF46AFD926B7 (user_id), add constraint FK143BF46AFD926B7 foreig
 n key (user_id) references app_user (id);
 WARN - JDBCExceptionReporter.logWarnings(48) | SQL Warning: 1287, SQLState: HY000
 WARN - JDBCExceptionReporter.logWarnings(49) | 'TYPE=storage_engine' is deprecated; use 'ENGINE=stor
 age_engine' instead
 WARN - JDBCExceptionReporter.logWarnings(48) | SQL Warning: 1287, SQLState: HY000
 WARN - JDBCExceptionReporter.logWarnings(49) | 'TYPE=storage_engine' is deprecated; use 'ENGINE=stor
 age_engine' instead
 WARN - JDBCExceptionReporter.logWarnings(48) | SQL Warning: 1287, SQLState: HY000
 WARN - JDBCExceptionReporter.logWarnings(49) | 'TYPE=storage_engine' is deprecated; use 'ENGINE=stor
 age_engine' instead
 [INFO] [compiler:testCompile]
 [INFO] Compiling 21 source files to C:\root\projects\full-source\vas\core\target\test-classes
 [INFO] [dbunit:operation {execution: default}]
 [INFO] [surefire:test]
 [INFO] Surefire report directory: C:\root\projects\full-source\vas\core\target\surefire-reports
 
 -------------------------------------------------------
  T E S T S
 -------------------------------------------------------
 Running com.tango.vas.service.MailEngineTest
 INFO - AbstractSingleSpringContextTests.loadContextLocations(177) | Loading context for locations: /
 applicationContext-resources.xml,classpath:/applicationContext-dao.xml,/applicationContext-service.x
 ml,classpath*:/**/applicationContext.xml
 Tests run: 2, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 5.921 sec
 Running com.tango.vas.service.impl.UserManagerImplTest
 DEBUG - UserManagerImpl.removeUser(73) | removing user: 5
 org.springframework.dao.DataIntegrityViolationException:
         at org.jmock.core.stub.ThrowStub.invoke(ThrowStub.java:21)
         at org.jmock.core.InvocationMocker.invoke(InvocationMocker.java:55)
         at org.jmock.core.AbstractInvocationDispatcher.dispatch(AbstractInvocationDispatcher.java:68
 )
         at org.jmock.core.AbstractDynamicMock.mockInvocation(AbstractDynamicMock.java:89)
         at org.jmock.core.CoreMock.invoke(CoreMock.java:39)
         at $Proxy26.saveUser(Unknown Source)
         at com.tango.vas.service.impl.UserManagerImpl.saveUser(UserManagerImpl.java:57)
         at com.tango.vas.service.impl.UserManagerImplTest.testUserExistsException(UserManagerImplTes
 t.java:98)
         at sun.reflect.NativeMethodAccessorImpl.invoke0(Native Method)
         at sun.reflect.NativeMethodAccessorImpl.invoke(Unknown Source)
         at sun.reflect.DelegatingMethodAccessorImpl.invoke(Unknown Source)
         at java.lang.reflect.Method.invoke(Unknown Source)
         at junit.framework.TestCase.runTest(TestCase.java:168)
         at org.jmock.core.VerifyingTestCase.runBare(VerifyingTestCase.java:39)
         at junit.framework.TestResult$1.protect(TestResult.java:110)
         at junit.framework.TestResult.runProtected(TestResult.java:128)
         at junit.framework.TestResult.run(TestResult.java:113)
         at junit.framework.TestCase.run(TestCase.java:124)
         at junit.framework.TestSuite.runTest(TestSuite.java:232)
         at junit.framework.TestSuite.run(TestSuite.java:227)
         at sun.reflect.NativeMethodAccessorImpl.invoke0(Native Method)
         at sun.reflect.NativeMethodAccessorImpl.invoke(Unknown Source)
         at sun.reflect.DelegatingMethodAccessorImpl.invoke(Unknown Source)
         at java.lang.reflect.Method.invoke(Unknown Source)
         at org.apache.maven.surefire.junit.JUnitTestSet.execute(JUnitTestSet.java:210)
         at org.apache.maven.surefire.suite.AbstractDirectoryTestSuite.executeTestSet(AbstractDirecto
 ryTestSuite.java:135)
         at org.apache.maven.surefire.suite.AbstractDirectoryTestSuite.execute(AbstractDirectoryTestS
 uite.java:122)
         at org.apache.maven.surefire.Surefire.run(Surefire.java:129)
         at sun.reflect.NativeMethodAccessorImpl.invoke0(Native Method)
         at sun.reflect.NativeMethodAccessorImpl.invoke(Unknown Source)
         at sun.reflect.DelegatingMethodAccessorImpl.invoke(Unknown Source)
 WARN - UserManagerImpl.saveUser(60) |
 DEBUG - UserManagerImplTest.testUserExistsException(101) | expected exception: User 'admin' already
 exists!
         at java.lang.reflect.Method.invoke(Unknown Source)
         at org.apache.maven.surefire.booter.SurefireBooter.runSuitesInProcess(SurefireBooter.java:22
 5)
         at org.apache.maven.surefire.booter.SurefireBooter.main(SurefireBooter.java:747)
 Tests run: 4, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 0.235 sec
 Running com.tango.vas.util.DateUtilTest
 DEBUG - DateUtilTest.testGetDate(44) | db date to convert: Wed Oct 03 12:31:52 BST 2007
 DEBUG - DateUtilTest.testGetDate(50) | converted ui date: 10/03/2007
 DEBUG - DateUtilTest.testGetDateTime(58) | entered 'testGetDateTime' method
 DEBUG - DateUtilTest.testGetDateTime(62) | 12:31
 Tests run: 3, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 0.062 sec
 Running com.tango.vas.service.UserExistsExceptionTest
 INFO - AbstractSingleSpringContextTests.loadContextLocations(177) | Loading context for locations: /
 applicationContext-service.xml,/applicationContext-resources.xml,classpath:/applicationContext-dao.x
 ml
 INFO - AbstractTransactionalSpringContextTests.startNewTransaction(323) | Began transaction (1): tra
 nsaction manager [org.springframework.orm.jpa.JpaTransactionManager@cc7f9e]; default rollback = true
 
 DEBUG - UserExistsExceptionTest.testAddExistingUser(21) | entered 'testAddExistingUser' method
 WARN - JDBCExceptionReporter.logExceptions(77) | SQL Error: 1062, SQLState: 23000
 ERROR - JDBCExceptionReporter.logExceptions(78) | Duplicate entry 'user' for key 2
 javax.persistence.EntityExistsException: org.hibernate.exception.ConstraintViolationException: could
  not insert: [com.tango.vas.model.User]
         at org.hibernate.ejb.AbstractEntityManagerImpl.throwPersistenceException(AbstractEntityManag
 erImpl.java:605)
         at org.hibernate.ejb.AbstractEntityManagerImpl.merge(AbstractEntityManagerImpl.java:237)
         at sun.reflect.NativeMethodAccessorImpl.invoke0(Native Method)
         at sun.reflect.NativeMethodAccessorImpl.invoke(Unknown Source)
         at sun.reflect.DelegatingMethodAccessorImpl.invoke(Unknown Source)
         at java.lang.reflect.Method.invoke(Unknown Source)
         at org.springframework.orm.jpa.SharedEntityManagerCreator$SharedEntityManagerInvocationHandl
 er.invoke(SharedEntityManagerCreator.java:180)
         at $Proxy31.merge(Unknown Source)
         at com.tango.vas.dao.jpa.GenericDaoJpa.save(GenericDaoJpa.java:91)
         at com.tango.vas.dao.jpa.UserDaoJpa.saveUser(UserDaoJpa.java:64)
         at sun.reflect.NativeMethodAccessorImpl.invoke0(Native Method)
         at sun.reflect.NativeMethodAccessorImpl.invoke(Unknown Source)
         at sun.reflect.DelegatingMethodAccessorImpl.invoke(Unknown Source)
         at java.lang.reflect.Method.invoke(Unknown Source)
         at org.springframework.aop.support.AopUtils.invokeJoinpointUsingReflection(AopUtils.java:296
 )
         at org.springframework.aop.framework.JdkDynamicAopProxy.invoke(JdkDynamicAopProxy.java:198)
         at $Proxy32.saveUser(Unknown Source)
         at com.tango.vas.service.impl.UserManagerImpl.saveUser(UserManagerImpl.java:57)
         at sun.reflect.NativeMethodAccessorImpl.invoke0(Native Method)
         at sun.reflect.NativeMethodAccessorImpl.invoke(Unknown Source)
         at sun.reflect.DelegatingMethodAccessorImpl.invoke(Unknown Source)
         at java.lang.reflect.Method.invoke(Unknown Source)
         at org.springframework.aop.support.AopUtils.invokeJoinpointUsingReflection(AopUtils.java:296
 )
         at org.springframework.aop.framework.ReflectiveMethodInvocation.invokeJoinpoint(ReflectiveMe
 thodInvocation.java:177)
         at org.springframework.aop.framework.ReflectiveMethodInvocation.proceed(ReflectiveMethodInvo
 cation.java:144)
         at org.springframework.transaction.interceptor.TransactionInterceptor.invoke(TransactionInte
 rceptor.java:107)
         at org.springframework.aop.framework.ReflectiveMethodInvocation.proceed(ReflectiveMethodInvo
 cation.java:166)
         at org.springframework.aop.framework.adapter.AfterReturningAdviceInterceptor.invoke(AfterRet
 urningAdviceInterceptor.java:50)
         at org.springframework.aop.framework.ReflectiveMethodInvocation.proceed(ReflectiveMethodInvo
 cation.java:166)
         at org.springframework.aop.framework.adapter.MethodBeforeAdviceInterceptor.invoke(MethodBefo
 reAdviceInterceptor.java:50)
         at org.springframework.aop.framework.ReflectiveMethodInvocation.proceed(ReflectiveMethodInvo
 cation.java:166)
         at org.springframework.transaction.interceptor.TransactionInterceptor.invoke(TransactionInte
 rceptor.java:107)
         at org.springframework.aop.framework.ReflectiveMethodInvocation.proceed(ReflectiveMethodInvo
 cation.java:166)
         at org.springframework.aop.framework.JdkDynamicAopProxy.invoke(JdkDynamicAopProxy.java:204)
         at $Proxy33.saveUser(Unknown Source)
         at com.tango.vas.service.UserExistsExceptionTest.testAddExistingUser(UserExistsExceptionTest
 .java:35)
         at sun.reflect.NativeMethodAccessorImpl.invoke0(Native Method)
         at sun.reflect.NativeMethodAccessorImpl.invoke(Unknown Source)
         at sun.reflect.DelegatingMethodAccessorImpl.invoke(Unknown Source)
         at java.lang.reflect.Method.invoke(Unknown Source)
         at junit.framework.TestCase.runTest(TestCase.java:168)
         at junit.framework.TestCase.runBare(TestCase.java:134)
         at org.springframework.test.ConditionalTestCase.runBare(ConditionalTestCase.java:69)
         at junit.framework.TestResult$1.protect(TestResult.java:110)
         at junit.framework.TestResult.runProtected(TestResult.java:128)
         at junit.framework.TestResult.run(TestResult.java:113)
         at junit.framework.TestCase.run(TestCase.java:124)
         at junit.framework.TestSuite.runTest(TestSuite.java:232)
         at junit.framework.TestSuite.run(TestSuite.java:227)
         at sun.reflect.NativeMethodAccessorImpl.invoke0(Native Method)
         at sun.reflect.NativeMethodAccessorImpl.invoke(Unknown Source)
         at sun.reflect.DelegatingMethodAccessorImpl.invoke(Unknown Source)
         at java.lang.reflect.Method.invoke(Unknown Source)
         at org.apache.maven.surefire.junit.JUnitTestSet.execute(JUnitTestSet.java:210)
         at org.apache.maven.surefire.suite.AbstractDirectoryTestSuite.executeTestSet(AbstractDirecto
 ryTestSuite.java:135)
         at org.apache.maven.surefire.suite.AbstractDirectoryTestSuite.execute(AbstractDirectoryTestS
 uite.java:122)
         at org.apache.maven.surefire.Surefire.run(Surefire.java:129)
         at sun.reflect.NativeMethodAccessorImpl.invoke0(Native Method)
         at sun.reflect.NativeMethodAccessorImpl.invoke(Unknown Source)
         at sun.reflect.DelegatingMethodAccessorImpl.invoke(Unknown Source)
         at java.lang.reflect.Method.invoke(Unknown Source)
         at org.apache.maven.surefire.booter.SurefireBooter.runSuitesInProcess(SurefireBooter.java:22
 5)
         at org.apache.maven.surefire.booter.SurefireBooter.main(SurefireBooter.java:747)
 Caused by: org.hibernate.exception.ConstraintViolationException: could not insert: [com.tango.vas.mo
 del.User]
         at org.hibernate.exception.SQLStateConverter.convert(SQLStateConverter.java:71)
         at org.hibernate.exception.JDBCExceptionHelper.convert(JDBCExceptionHelper.java:43)
         at org.hibernate.id.insert.AbstractReturningDelegate.performInsert(AbstractReturningDelegate
 .java:40)
         at org.hibernate.persister.entity.AbstractEntityPersister.insert(AbstractEntityPersister.jav
 a:2158)
         at org.hibernate.persister.entity.AbstractEntityPersister.insert(AbstractEntityPersister.jav
 a:2638)
         at org.hibernate.action.EntityIdentityInsertAction.execute(EntityIdentityInsertAction.java:4
 8)
         at org.hibernate.engine.ActionQueue.execute(ActionQueue.java:250)
         at org.hibernate.event.def.AbstractSaveEventListener.performSaveOrReplicate(AbstractSaveEven
 tListener.java:298)
         at org.hibernate.event.def.AbstractSaveEventListener.performSave(AbstractSaveEventListener.j
 ava:181)
         at org.hibernate.event.def.AbstractSaveEventListener.saveWithGeneratedId(AbstractSaveEventLi
 stener.java:107)
         at org.hibernate.ejb.event.EJB3MergeEventListener.saveWithGeneratedId(EJB3MergeEventListener
 .java:43)
         at org.hibernate.event.def.DefaultMergeEventListener.entityIsTransient(DefaultMergeEventList
 ener.java:186)
         at org.hibernate.event.def.DefaultMergeEventListener.onMerge(DefaultMergeEventListener.java:
 123)
         at org.hibernate.event.def.DefaultMergeEventListener.onMerge(DefaultMergeEventListener.java:
 53)
         at org.hibernate.impl.SessionImpl.fireMerge(SessionImpl.java:677)
         at org.hibernate.impl.SessionImpl.merge(SessionImpl.java:661)
         at org.hibernate.impl.SessionImpl.merge(SessionImpl.java:665)
         at org.hibernate.ejb.AbstractEntityManagerImpl.merge(AbstractEntityManagerImpl.java:228)
         ... 61 more
 Caused by: com.mysql.jdbc.exceptions.MySQLIntegrityConstraintViolationException: Duplicate entry 'us
 er' for key 2
 WARN - UserManagerImpl.saveUser(64) | org.hibernate.exception.ConstraintViolationException: could no
 t insert: [com.tango.vas.model.User]
         at com.mysql.jdbc.SQLError.createSQLException(SQLError.java:931)
         at com.mysql.jdbc.MysqlIO.checkErrorPacket(MysqlIO.java:2941)
         at com.mysql.jdbc.MysqlIO.sendCommand(MysqlIO.java:1623)
         at com.mysql.jdbc.MysqlIO.sqlQueryDirect(MysqlIO.java:1715)
         at com.mysql.jdbc.Connection.execSQL(Connection.java:3249)
         at com.mysql.jdbc.PreparedStatement.executeInternal(PreparedStatement.java:1268)
         at com.mysql.jdbc.PreparedStatement.executeUpdate(PreparedStatement.java:1541)
         at com.mysql.jdbc.PreparedStatement.executeUpdate(PreparedStatement.java:1455)
         at com.mysql.jdbc.PreparedStatement.executeUpdate(PreparedStatement.java:1440)
         at org.hibernate.id.IdentityGenerator$GetGeneratedKeysDelegate.executeAndExtract(IdentityGen
 erator.java:73)
         at org.hibernate.id.insert.AbstractReturningDelegate.performInsert(AbstractReturningDelegate
 .java:33)
         ... 76 more
 INFO - AbstractTransactionalSpringContextTests.endTransaction(290) | Rolled back transaction after t
 est execution
 Tests run: 1, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 1 sec
 Running com.tango.vas.dao.UniversalDaoTest
 INFO - AbstractTransactionalSpringContextTests.startNewTransaction(323) | Began transaction (1): tra
 nsaction manager [org.springframework.orm.jpa.JpaTransactionManager@b28980]; default rollback = true
 
 WARN - UniversalDaoJpa.get(51) | Uh oh, 'class com.tango.vas.model.User' object with id '1' not foun
 d...
 INFO - AbstractTransactionalSpringContextTests.endTransaction(290) | Rolled back transaction after t
 est execution
 Tests run: 1, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 2.235 sec
 Running com.tango.vas.service.UserSecurityAdviceTest
 WARN - UserSecurityAdvice.before(71) | Access Denied: 'user' tried to modify 'admin'!
 WARN - UserSecurityAdvice.before(92) | Access Denied: 'user' tried to change their role(s)!
 WARN - UserSecurityAdvice.before(92) | Access Denied: 'user' tried to change their role(s)!
 Tests run: 7, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 0.218 sec
 Running com.tango.vas.util.StringUtilTest
 Tests run: 1, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 0.016 sec
 Running com.tango.vas.dao.LookupDaoTest
 INFO - AbstractTransactionalSpringContextTests.startNewTransaction(323) | Began transaction (1): tra
 nsaction manager [org.springframework.orm.jpa.JpaTransactionManager@b28980]; default rollback = true
 
 DEBUG - LookupDaoJpa.getRoles(20) | retrieving all role names...
 DEBUG - LookupDaoTest.testGetRoles(18) | [ROLE_ADMIN, ROLE_USER]
 INFO - AbstractTransactionalSpringContextTests.endTransaction(290) | Rolled back transaction after t
 est execution
 Tests run: 1, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 0.281 sec
 Running com.tango.vas.dao.RoleDaoTest
 INFO - AbstractTransactionalSpringContextTests.startNewTransaction(323) | Began transaction (1): tra
 nsaction manager [org.springframework.orm.jpa.JpaTransactionManager@b28980]; default rollback = true
 
 INFO - AbstractTransactionalSpringContextTests.endTransaction(290) | Rolled back transaction after t
 est execution
 INFO - AbstractTransactionalSpringContextTests.startNewTransaction(323) | Began transaction (1): tra
 nsaction manager [org.springframework.orm.jpa.JpaTransactionManager@b28980]; default rollback = true
 
 INFO - AbstractTransactionalSpringContextTests.endTransaction(290) | Rolled back transaction after t
 est execution
 INFO - AbstractTransactionalSpringContextTests.startNewTransaction(323) | Began transaction (1): tra
 nsaction manager [org.springframework.orm.jpa.JpaTransactionManager@b28980]; default rollback = true
 
 DEBUG - RoleDaoTest.testUpdateRole(25) | ROLE_USER
 INFO - AbstractTransactionalSpringContextTests.endTransaction(290) | Rolled back transaction after t
 est execution
 INFO - AbstractTransactionalSpringContextTests.startNewTransaction(323) | Began transaction (1): tra
 nsaction manager [org.springframework.orm.jpa.JpaTransactionManager@b28980]; default rollback = true
 
 INFO - AbstractTransactionalSpringContextTests.endTransaction(294) | Committed transaction after tes
 t execution
 INFO - AbstractTransactionalSpringContextTests.startNewTransaction(323) | Began transaction (2): tra
 nsaction manager [org.springframework.orm.jpa.JpaTransactionManager@b28980]; default rollback = true
 
 INFO - AbstractTransactionalSpringContextTests.endTransaction(294) | Committed transaction after tes
 t execution
 INFO - AbstractTransactionalSpringContextTests.startNewTransaction(323) | Began transaction (3): tra
 nsaction manager [org.springframework.orm.jpa.JpaTransactionManager@b28980]; default rollback = true
 
 INFO - AbstractTransactionalSpringContextTests.endTransaction(290) | Rolled back transaction after t
 est execution
 Tests run: 4, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 0.609 sec
 Running com.tango.vas.service.impl.UniversalManagerTest
 Tests run: 4, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 0.032 sec
 Running com.tango.vas.util.DateConverterTest
 Tests run: 5, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 0.125 sec
 Running CoreTest
 Tests run: 1, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 0.015 sec
 Running com.tango.vas.dao.UserDaoTest
 INFO - AbstractTransactionalSpringContextTests.startNewTransaction(323) | Began transaction (1): tra
 nsaction manager [org.springframework.orm.jpa.JpaTransactionManager@b28980]; default rollback = true
 
 WARN - GenericDaoJpa.get(72) | Uh oh, 'class com.tango.vas.model.User' object with id '1000' not fou
 nd...
 WARN - LoadContexts.cleanup(108) | fail-safe cleanup (collections) : org.hibernate.engine.loading.Co
 llectionLoadContext@fbbbc<rs=com.mysql.jdbc.ResultSet@1bb8694>
 INFO - AbstractTransactionalSpringContextTests.endTransaction(290) | Rolled back transaction after t
 est execution
 INFO - AbstractTransactionalSpringContextTests.startNewTransaction(323) | Began transaction (1): tra
 nsaction manager [org.springframework.orm.jpa.JpaTransactionManager@b28980]; default rollback = true
 
 INFO - AbstractTransactionalSpringContextTests.endTransaction(290) | Rolled back transaction after t
 est execution
 INFO - AbstractTransactionalSpringContextTests.startNewTransaction(323) | Began transaction (1): tra
 nsaction manager [org.springframework.orm.jpa.JpaTransactionManager@b28980]; default rollback = true
 
 INFO - AbstractTransactionalSpringContextTests.endTransaction(290) | Rolled back transaction after t
 est execution
 INFO - AbstractTransactionalSpringContextTests.startNewTransaction(323) | Began transaction (2): tra
 nsaction manager [org.springframework.orm.jpa.JpaTransactionManager@b28980]; default rollback = true
 
 WARN - JDBCExceptionReporter.logExceptions(77) | SQL Error: 1062, SQLState: 23000
 ERROR - JDBCExceptionReporter.logExceptions(78) | Duplicate entry 'user' for key 2
 DEBUG - UserDaoTest.testUpdateUser(66) | expected exception: org.hibernate.exception.ConstraintViola
 tionException: could not insert: [com.tango.vas.model.User]
 INFO - AbstractTransactionalSpringContextTests.endTransaction(290) | Rolled back transaction after t
 est execution
 INFO - AbstractTransactionalSpringContextTests.startNewTransaction(323) | Began transaction (1): tra
 nsaction manager [org.springframework.orm.jpa.JpaTransactionManager@b28980]; default rollback = true
 
 INFO - AbstractTransactionalSpringContextTests.endTransaction(290) | Rolled back transaction after t
 est execution
 INFO - AbstractTransactionalSpringContextTests.startNewTransaction(323) | Began transaction (1): tra
 nsaction manager [org.springframework.orm.jpa.JpaTransactionManager@b28980]; default rollback = true
 
 WARN - GenericDaoJpa.get(72) | Uh oh, 'class com.tango.vas.model.User' object with id '2' not found.
 ..
 INFO - AbstractTransactionalSpringContextTests.endTransaction(290) | Rolled back transaction after t
 est execution
 INFO - AbstractTransactionalSpringContextTests.startNewTransaction(323) | Began transaction (1): tra
 nsaction manager [org.springframework.orm.jpa.JpaTransactionManager@b28980]; default rollback = true
 
 INFO - AbstractTransactionalSpringContextTests.endTransaction(290) | Rolled back transaction after t
 est execution
 INFO - AbstractTransactionalSpringContextTests.startNewTransaction(323) | Began transaction (1): tra
 nsaction manager [org.springframework.orm.jpa.JpaTransactionManager@b28980]; default rollback = true
 
 WARN - LoadContexts.cleanup(108) | fail-safe cleanup (collections) : org.hibernate.engine.loading.Co
 llectionLoadContext@1d688e2<rs=com.mysql.jdbc.ResultSet@b049a>
 INFO - AbstractTransactionalSpringContextTests.endTransaction(290) | Rolled back transaction after t
 est execution
 Tests run: 7, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 0.313 sec
 Running com.tango.vas.service.impl.LookupManagerImplTest
 DEBUG - LookupManagerImplTest.testGetAllRoles(24) | entered 'testGetAllRoles' method
 Tests run: 1, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 0.015 sec
 Running com.tango.vas.service.UserManagerTest
 INFO - AbstractTransactionalSpringContextTests.startNewTransaction(323) | Began transaction (1): tra
 nsaction manager [org.springframework.orm.jpa.JpaTransactionManager@102be12]; default rollback = tru
 e
 DEBUG - UserManagerTest.testGetUser(28) | com.tango.vas.model.User@7e80a[username=user,enabled=true,
 accountExpired=false,credentialsExpired=false,accountLocked=false,Granted Authorities: ,ROLE_USER]
 INFO - AbstractTransactionalSpringContextTests.endTransaction(290) | Rolled back transaction after t
 est execution
 INFO - AbstractTransactionalSpringContextTests.startNewTransaction(323) | Began transaction (1): tra
 nsaction manager [org.springframework.orm.jpa.JpaTransactionManager@102be12]; default rollback = tru
 e
 DEBUG - UserManagerTest.testAddAndRemoveUser(56) | removing user...
 DEBUG - UserManagerImpl.removeUser(73) | removing user: 3
 DEBUG - UserManagerTest.testAddAndRemoveUser(64) | org.acegisecurity.userdetails.UsernameNotFoundExc
 eption: user 'john' not found...
 INFO - AbstractTransactionalSpringContextTests.endTransaction(290) | Rolled back transaction after t
 est execution
 INFO - AbstractTransactionalSpringContextTests.startNewTransaction(323) | Began transaction (1): tra
 nsaction manager [org.springframework.orm.jpa.JpaTransactionManager@102be12]; default rollback = tru
 e
 DEBUG - UserManagerTest.testSaveUser(36) | saving user with updated phone number: com.tango.vas.mode
 l.User@1eb717e[username=user,enabled=true,accountExpired=false,credentialsExpired=false,accountLocke
 d=false,Granted Authorities: ,ROLE_USER]
 INFO - AbstractTransactionalSpringContextTests.endTransaction(290) | Rolled back transaction after t
 est execution
 Tests run: 3, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 0.438 sec
 
 Results :
 Tests run: 45, Failures: 0, Errors: 0, Skipped: 0
 
 [INFO] [jar:jar]
 [INFO] Building jar: C:\root\projects\full-source\vas\core\target\vas-core-1.0-SNAPSHOT.jar
 [INFO] [install:install]
 [INFO] Installing C:\root\projects\full-source\vas\core\target\vas-core-1.0-SNAPSHOT.jar to D:\maven
 \repository\com\tango\vas\vas-core\1.0-SNAPSHOT\vas-core-1.0-SNAPSHOT.jar
 [INFO] ----------------------------------------------------------------------------
 [INFO] Building AppFuse Modular Application - Web (Spring MVC)
 [INFO] task-segment: [install]
 [INFO] ----------------------------------------------------------------------------
 [INFO] [native2ascii:native2ascii {execution: native2ascii-utf8}]
 [INFO] [native2ascii:native2ascii {execution: native2ascii-8859_1}]
 [INFO] [resources:resources]
 [INFO] Using default encoding to copy filtered resources.
 [INFO] [compiler:compile]
 [INFO] Compiling 22 source files to C:\root\projects\full-source\vas\web\target\classes
 [INFO] [resources:testResources]
 [INFO] Using default encoding to copy filtered resources.
 [INFO] [compiler:testCompile]
 [INFO] Compiling 9 source files to C:\root\projects\full-source\vas\web\target\test-classes
 [INFO] [dbunit:operation {execution: test-compile}]
 [INFO] [surefire:test]
 [INFO] Surefire report directory: C:\root\projects\full-source\vas\web\target\surefire-reports
 
 -------------------------------------------------------
  T E S T S
 -------------------------------------------------------
 Running com.tango.vas.webapp.listener.StartupListenerTest
 WARN [main] DefaultNamespaceHandlerResolver.initHandlerMappings(133) | Ignoring namespace handler [o
 rg.springmodules.validation.bean.conf.namespace.ValidatorNamespaceHandler]: problem with handler cla
 ss file or dependent class
 java.lang.NoSuchFieldError: IS_JAVA_1_6
         at org.springmodules.validation.util.LibraryUtils.<clinit>(LibraryUtils.java:40)
         at org.springmodules.validation.bean.conf.namespace.ValidatorNamespaceHandler.init(Validator
 NamespaceHandler.java:51)
         at org.springframework.beans.factory.xml.DefaultNamespaceHandlerResolver.initHandlerMappings
 (DefaultNamespaceHandlerResolver.java:123)
         at org.springframework.beans.factory.xml.DefaultNamespaceHandlerResolver.<init>(DefaultNames
 paceHandlerResolver.java:96)
         at org.springframework.beans.factory.xml.DefaultNamespaceHandlerResolver.<init>(DefaultNames
 paceHandlerResolver.java:82)
         at org.springframework.beans.factory.xml.XmlBeanDefinitionReader.createDefaultNamespaceHandl
 erResolver(XmlBeanDefinitionReader.java:488)
         at org.springframework.beans.factory.xml.XmlBeanDefinitionReader.createReaderContext(XmlBean
 DefinitionReader.java:477)
         at org.springframework.beans.factory.xml.XmlBeanDefinitionReader.registerBeanDefinitions(Xml
 BeanDefinitionReader.java:458)
         at org.springframework.beans.factory.xml.XmlBeanDefinitionReader.doLoadBeanDefinitions(XmlBe
 anDefinitionReader.java:353)
         at org.springframework.beans.factory.xml.XmlBeanDefinitionReader.loadBeanDefinitions(XmlBean
 DefinitionReader.java:303)
         at org.springframework.beans.factory.xml.XmlBeanDefinitionReader.loadBeanDefinitions(XmlBean
 DefinitionReader.java:280)
         at org.springframework.beans.factory.support.AbstractBeanDefinitionReader.loadBeanDefinition
 s(AbstractBeanDefinitionReader.java:131)
         at org.springframework.beans.factory.support.AbstractBeanDefinitionReader.loadBeanDefinition
 s(AbstractBeanDefinitionReader.java:147)
         at org.springframework.web.context.support.XmlWebApplicationContext.loadBeanDefinitions(XmlW
 ebApplicationContext.java:124)
         at org.springframework.web.context.support.XmlWebApplicationContext.loadBeanDefinitions(XmlW
 ebApplicationContext.java:92)
         at org.springframework.context.support.AbstractRefreshableApplicationContext.refreshBeanFact
 ory(AbstractRefreshableApplicationContext.java:101)
         at org.springframework.context.support.AbstractApplicationContext.obtainFreshBeanFactory(Abs
 tractApplicationContext.java:389)
         at org.springframework.context.support.AbstractApplicationContext.refresh(AbstractApplicatio
 nContext.java:324)
         at org.springframework.web.context.ContextLoader.createWebApplicationContext(ContextLoader.j
 ava:244)
         at org.springframework.web.context.ContextLoader.initWebApplicationContext(ContextLoader.jav
 a:187)
         at org.springframework.web.context.ContextLoaderListener.contextInitialized(ContextLoaderLis
 tener.java:49)
         at com.tango.vas.webapp.listener.StartupListenerTest.setUp(StartupListenerTest.java:39)
         at junit.framework.TestCase.runBare(TestCase.java:132)
         at junit.framework.TestResult$1.protect(TestResult.java:110)
         at junit.framework.TestResult.runProtected(TestResult.java:128)
         at junit.framework.TestResult.run(TestResult.java:113)
         at junit.framework.TestCase.run(TestCase.java:124)
         at junit.framework.TestSuite.runTest(TestSuite.java:232)
         at junit.framework.TestSuite.run(TestSuite.java:227)
         at sun.reflect.NativeMethodAccessorImpl.invoke0(Native Method)
         at sun.reflect.NativeMethodAccessorImpl.invoke(Unknown Source)
         at sun.reflect.DelegatingMethodAccessorImpl.invoke(Unknown Source)
         at java.lang.reflect.Method.invoke(Unknown Source)
         at org.apache.maven.surefire.junit.JUnitTestSet.execute(JUnitTestSet.java:210)
         at org.apache.maven.surefire.suite.AbstractDirectoryTestSuite.executeTestSet(AbstractDirecto
 ryTestSuite.java:135)
         at org.apache.maven.surefire.suite.AbstractDirectoryTestSuite.execute(AbstractDirectoryTestS
 uite.java:122)
         at org.apache.maven.surefire.Surefire.run(Surefire.java:129)
         at sun.reflect.NativeMethodAccessorImpl.invoke0(Native Method)
         at sun.reflect.NativeMethodAccessorImpl.invoke(Unknown Source)
         at sun.reflect.DelegatingMethodAccessorImpl.invoke(Unknown Source)
         at java.lang.reflect.Method.invoke(Unknown Source)
         at org.apache.maven.surefire.booter.SurefireBooter.runSuitesInProcess(SurefireBooter.java:22
 5)
         at org.apache.maven.surefire.booter.SurefireBooter.main(SurefireBooter.java:747)
 DEBUG [main] StartupListener.contextInitialized(37) | initializing context...
 DEBUG [main] StartupListener.contextInitialized(76) | authenticationManager bean not found, assuming
  test and ignoring...
 DEBUG [main] StartupListener.contextInitialized(84) | Remember Me Enabled? null
 DEBUG [main] StartupListener.contextInitialized(85) | Encrypt Passwords? false
 DEBUG [main] StartupListener.contextInitialized(89) | Populating drop-downs...
 DEBUG [main] LookupDaoJpa.getRoles(20) | retrieving all role names...
 DEBUG [main] StartupListener.setupContext(105) | Drop-down initialization complete [OK]
 Tests run: 1, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 3.454 sec
 Running com.tango.vas.webapp.filter.StaticFilterTest
 DEBUG [main] MockFilterChain.doFilter(37) | Forwarding to: /editProfile.html
 Tests run: 2, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 0.14 sec
 Running com.tango.vas.webapp.controller.PasswordHintControllerTest
 INFO [main] PasswordHintControllerTest.loadContextLocations(51) | Loading additional configuration f
 rom: classpath:/applicationContext-resources.xml,classpath:/applicationContext-dao.xml,classpath:/ap
 plicationContext-service.xml,classpath*:/applicationContext.xml,/WEB-INF/applicationContext*.xml,/WE
 B-INF/dispatcher-servlet.xml
 WARN [main] DefaultNamespaceHandlerResolver.initHandlerMappings(133) | Ignoring namespace handler [o
 rg.springmodules.validation.bean.conf.namespace.ValidatorNamespaceHandler]: problem with handler cla
 ss file or dependent class
 java.lang.NoClassDefFoundError: Could not initialize class org.springmodules.validation.util.Library
 Utils
         at org.springmodules.validation.bean.conf.namespace.ValidatorNamespaceHandler.init(Validator
 NamespaceHandler.java:51)
         at org.springframework.beans.factory.xml.DefaultNamespaceHandlerResolver.initHandlerMappings
 (DefaultNamespaceHandlerResolver.java:123)
         at org.springframework.beans.factory.xml.DefaultNamespaceHandlerResolver.<init>(DefaultNames
 paceHandlerResolver.java:96)
         at org.springframework.beans.factory.xml.DefaultNamespaceHandlerResolver.<init>(DefaultNames
 paceHandlerResolver.java:82)
         at org.springframework.beans.factory.xml.XmlBeanDefinitionReader.createDefaultNamespaceHandl
 erResolver(XmlBeanDefinitionReader.java:488)
         at org.springframework.beans.factory.xml.XmlBeanDefinitionReader.createReaderContext(XmlBean
 DefinitionReader.java:477)
         at org.springframework.beans.factory.xml.XmlBeanDefinitionReader.registerBeanDefinitions(Xml
 BeanDefinitionReader.java:458)
         at org.springframework.beans.factory.xml.XmlBeanDefinitionReader.doLoadBeanDefinitions(XmlBe
 anDefinitionReader.java:353)
         at org.springframework.beans.factory.xml.XmlBeanDefinitionReader.loadBeanDefinitions(XmlBean
 DefinitionReader.java:303)
         at org.springframework.beans.factory.xml.XmlBeanDefinitionReader.loadBeanDefinitions(XmlBean
 DefinitionReader.java:280)
         at org.springframework.beans.factory.support.AbstractBeanDefinitionReader.loadBeanDefinition
 s(AbstractBeanDefinitionReader.java:131)
         at org.springframework.beans.factory.support.AbstractBeanDefinitionReader.loadBeanDefinition
 s(AbstractBeanDefinitionReader.java:147)
         at org.springframework.web.context.support.XmlWebApplicationContext.loadBeanDefinitions(XmlW
 ebApplicationContext.java:124)
         at org.springframework.web.context.support.XmlWebApplicationContext.loadBeanDefinitions(XmlW
 ebApplicationContext.java:92)
         at org.springframework.context.support.AbstractRefreshableApplicationContext.refreshBeanFact
 ory(AbstractRefreshableApplicationContext.java:101)
         at org.springframework.context.support.AbstractApplicationContext.obtainFreshBeanFactory(Abs
 tractApplicationContext.java:389)
         at org.springframework.context.support.AbstractApplicationContext.refresh(AbstractApplicatio
 nContext.java:324)
         at com.tango.vas.webapp.controller.BaseControllerTestCase.loadContextLocations(BaseControlle
 rTestCase.java:56)
         at org.springframework.test.AbstractSingleSpringContextTests.loadContext(AbstractSingleSprin
 gContextTests.java:158)
         at org.springframework.test.AbstractSpringContextTests.getContext(AbstractSpringContextTests
 .java:105)
         at org.springframework.test.AbstractSingleSpringContextTests.setUp(AbstractSingleSpringConte
 xtTests.java:87)
         at junit.framework.TestCase.runBare(TestCase.java:132)
         at org.springframework.test.ConditionalTestCase.runBare(ConditionalTestCase.java:69)
         at junit.framework.TestResult$1.protect(TestResult.java:110)
         at junit.framework.TestResult.runProtected(TestResult.java:128)
         at junit.framework.TestResult.run(TestResult.java:113)
         at junit.framework.TestCase.run(TestCase.java:124)
         at junit.framework.TestSuite.runTest(TestSuite.java:232)
         at junit.framework.TestSuite.run(TestSuite.java:227)
         at sun.reflect.NativeMethodAccessorImpl.invoke0(Native Method)
         at sun.reflect.NativeMethodAccessorImpl.invoke(Unknown Source)
         at sun.reflect.DelegatingMethodAccessorImpl.invoke(Unknown Source)
         at java.lang.reflect.Method.invoke(Unknown Source)
         at org.apache.maven.surefire.junit.JUnitTestSet.execute(JUnitTestSet.java:210)
         at org.apache.maven.surefire.suite.AbstractDirectoryTestSuite.executeTestSet(AbstractDirecto
 ryTestSuite.java:135)
         at org.apache.maven.surefire.suite.AbstractDirectoryTestSuite.execute(AbstractDirectoryTestS
 uite.java:122)
         at org.apache.maven.surefire.Surefire.run(Surefire.java:129)
         at sun.reflect.NativeMethodAccessorImpl.invoke0(Native Method)
         at sun.reflect.NativeMethodAccessorImpl.invoke(Unknown Source)
         at sun.reflect.DelegatingMethodAccessorImpl.invoke(Unknown Source)
         at java.lang.reflect.Method.invoke(Unknown Source)
         at org.apache.maven.surefire.booter.SurefireBooter.runSuitesInProcess(SurefireBooter.java:22
 5)
         at org.apache.maven.surefire.booter.SurefireBooter.main(SurefireBooter.java:747)
 INFO [main] PasswordHintControllerTest.startNewTransaction(323) | Began transaction (1): transaction
  manager [org.springframework.orm.jpa.JpaTransactionManager@1e5ba24]; default rollback = true
 DEBUG [main] PasswordHintController.handleRequest(55) | entering 'handleRequest' method...
 DEBUG [main] PasswordHintController.handleRequest(69) | Processing Password Hint...
 INFO [main] PasswordHintControllerTest.endTransaction(290) | Rolled back transaction after test exec
 ution
 Tests run: 1, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 1.219 sec
 Running com.tango.vas.webapp.controller.UserFormControllerTest
 INFO [main] UserFormControllerTest.startNewTransaction(323) | Began transaction (1): transaction man
 ager [org.springframework.orm.jpa.JpaTransactionManager@1e5ba24]; default rollback = true
 DEBUG [main] UserFormControllerTest.testAdd(23) | testing add new user...
 DEBUG [main] UserFormController.showNewForm(322) | Displaying new form
 DEBUG [main] UserFormController.formBackingObject(174) | checking for remember me login...
 INFO [main] UserFormControllerTest.endTransaction(290) | Rolled back transaction after test executio
 n
 INFO [main] UserFormControllerTest.startNewTransaction(323) | Began transaction (1): transaction man
 ager [org.springframework.orm.jpa.JpaTransactionManager@1e5ba24]; default rollback = true
 DEBUG [main] UserFormControllerTest.testAddWithoutPermission(34) | testing add new user...
 DEBUG [main] UserFormController.showNewForm(322) | Displaying new form
 DEBUG [main] UserFormController.formBackingObject(174) | checking for remember me login...
 WARN [main] UserFormController.showForm(157) | User 'null' is trying to edit user with id 'null'
 INFO [main] UserFormControllerTest.endTransaction(290) | Rolled back transaction after test executio
 n
 INFO [main] UserFormControllerTest.startNewTransaction(323) | Began transaction (1): transaction man
 ager [org.springframework.orm.jpa.JpaTransactionManager@1e5ba24]; default rollback = true
 DEBUG [main] UserFormControllerTest.testCancel(47) | testing cancel...
 DEBUG [main] UserFormController.createCommand(340) | Creating new command of class [com.tango.vas.mo
 del.User]
 INFO [main] UserFormControllerTest.endTransaction(290) | Rolled back transaction after test executio
 n
 INFO [main] UserFormControllerTest.startNewTransaction(323) | Began transaction (1): transaction man
 ager [org.springframework.orm.jpa.JpaTransactionManager@1e5ba24]; default rollback = true
 DEBUG [main] UserFormControllerTest.testEdit(57) | testing edit...
 DEBUG [main] UserFormController.showNewForm(322) | Displaying new form
 DEBUG [main] UserFormController.formBackingObject(174) | checking for remember me login...
 INFO [main] UserFormControllerTest.endTransaction(290) | Rolled back transaction after test executio
 n
 INFO [main] UserFormControllerTest.startNewTransaction(323) | Began transaction (1): transaction man
 ager [org.springframework.orm.jpa.JpaTransactionManager@1e5ba24]; default rollback = true
 DEBUG [main] UserFormControllerTest.testEditWithoutPermission(70) | testing edit...
 DEBUG [main] UserFormController.showNewForm(322) | Displaying new form
 DEBUG [main] UserFormController.formBackingObject(174) | checking for remember me login...
 WARN [main] UserFormController.showForm(157) | User 'null' is trying to edit user with id '-1'
 INFO [main] UserFormControllerTest.endTransaction(290) | Rolled back transaction after test executio
 n
 INFO [main] UserFormControllerTest.startNewTransaction(323) | Began transaction (1): transaction man
 ager [org.springframework.orm.jpa.JpaTransactionManager@1e5ba24]; default rollback = true
 DEBUG [main] UserFormControllerTest.testEditProfile(83) | testing edit profile...
 DEBUG [main] UserFormController.showNewForm(322) | Displaying new form
 DEBUG [main] UserFormController.formBackingObject(174) | checking for remember me login...
 INFO [main] UserFormControllerTest.endTransaction(290) | Rolled back transaction after test executio
 n
 INFO [main] UserFormControllerTest.startNewTransaction(323) | Began transaction (1): transaction man
 ager [org.springframework.orm.jpa.JpaTransactionManager@1e5ba24]; default rollback = true
 DEBUG [main] UserFormController.processFormSubmission(266) | No errors -> processing submit
 DEBUG [main] UserFormController.onSubmit(66) | entering 'onSubmit' method...
 DEBUG [main] UserFormControllerTest.testSave(105) | {}
 INFO [main] UserFormControllerTest.endTransaction(290) | Rolled back transaction after test executio
 n
 INFO [main] UserFormControllerTest.startNewTransaction(323) | Began transaction (1): transaction man
 ager [org.springframework.orm.jpa.JpaTransactionManager@1e5ba24]; default rollback = true
 DEBUG [main] UserFormController.createCommand(340) | Creating new command of class [com.tango.vas.mo
 del.User]
 DEBUG [main] UserFormController.processFormSubmission(256) | Data binding errors: 10
 INFO [main] UserFormControllerTest.endTransaction(290) | Rolled back transaction after test executio
 n
 INFO [main] UserFormControllerTest.startNewTransaction(323) | Began transaction (1): transaction man
 ager [org.springframework.orm.jpa.JpaTransactionManager@1e5ba24]; default rollback = true
 DEBUG [main] UserFormController.processFormSubmission(266) | No errors -> processing submit
 DEBUG [main] UserFormController.onSubmit(66) | entering 'onSubmit' method...
 DEBUG [main] UserManagerImpl.removeUser(73) | removing user: -2
 INFO [main] UserFormControllerTest.endTransaction(290) | Rolled back transaction after test executio
 n
 Tests run: 9, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 0.843 sec
 Running com.tango.vas.webapp.controller.UserControllerTest
 INFO [main] UserControllerTest.startNewTransaction(323) | Began transaction (1): transaction manager
  [org.springframework.orm.jpa.JpaTransactionManager@1e5ba24]; default rollback = true
 DEBUG [main] UserController.handleRequest(38) | entering 'handleRequest' method...
 INFO [main] UserControllerTest.endTransaction(290) | Rolled back transaction after test execution
 Tests run: 1, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 0.047 sec
 Running com.tango.vas.webapp.controller.SignupControllerTest
 INFO [main] SignupControllerTest.startNewTransaction(323) | Began transaction (1): transaction manag
 er [org.springframework.orm.jpa.JpaTransactionManager@1e5ba24]; default rollback = true
 DEBUG [main] SignupController.showNewForm(322) | Displaying new form
 DEBUG [main] SignupController.createCommand(340) | Creating new command of class [com.tango.vas.mode
 l.User]
 INFO [main] SignupControllerTest.endTransaction(290) | Rolled back transaction after test execution
 INFO [main] SignupControllerTest.startNewTransaction(323) | Began transaction (1): transaction manag
 er [org.springframework.orm.jpa.JpaTransactionManager@1e5ba24]; default rollback = true
 DEBUG [main] SignupController.createCommand(340) | Creating new command of class [com.tango.vas.mode
 l.User]
 DEBUG [main] SignupController.processFormSubmission(266) | No errors -> processing submit
 DEBUG [main] SignupController.onSubmit(40) | entering 'onSubmit' method...
 DEBUG [main] SignupController.onSubmit(91) | Sending user 'self-registered' an account information e
 -mail
 DEBUG [main] SignupController.sendUserMessage(169) | sending e-mail to user [self-registered@raibled
 esigns.com]...
 WARN [main] VelocityEngine.logVelocityMessage(46) | org.apache.velocity.runtime.exception.ReferenceE
 xception: reference : template = accountCreated.vm [line 4,column 11] : ${user.confirmPassword} is n
 ot a valid reference.
 INFO [main] SignupControllerTest.endTransaction(290) | Rolled back transaction after test execution
 Tests run: 2, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 0.172 sec
 Running com.tango.vas.webapp.filter.LocaleFilterTest
 DEBUG [main] LocaleFilter.init(158) | Initializing filter ''
 DEBUG [main] LocaleFilter.init(183) | Filter '' configured successfully
 DEBUG [main] MockFilterChain.doFilter(37) | Forwarding to:
 DEBUG [main] LocaleFilter.init(158) | Initializing filter ''
 DEBUG [main] LocaleFilter.init(183) | Filter '' configured successfully
 DEBUG [main] MockFilterChain.doFilter(37) | Forwarding to:
 DEBUG [main] LocaleFilter.init(158) | Initializing filter ''
 DEBUG [main] LocaleFilter.init(183) | Filter '' configured successfully
 DEBUG [main] MockFilterChain.doFilter(37) | Forwarding to:
 DEBUG [main] LocaleFilter.init(158) | Initializing filter ''
 DEBUG [main] LocaleFilter.init(183) | Filter '' configured successfully
 DEBUG [main] MockFilterChain.doFilter(37) | Forwarding to:
 DEBUG [main] LocaleFilter.init(158) | Initializing filter ''
 DEBUG [main] LocaleFilter.init(183) | Filter '' configured successfully
 DEBUG [main] MockFilterChain.doFilter(37) | Forwarding to:
 Tests run: 5, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 0.031 sec
 Running com.tango.vas.AppTest
 Tests run: 1, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 0.032 sec
 
 Results :
 Tests run: 22, Failures: 0, Errors: 0, Skipped: 0
 
 [INFO] [dbunit:operation {execution: test}]
 [INFO] [war:war]
 [INFO] Exploding webapp...
 [INFO] Assembling webapp vas-webapp in C:\root\projects\full-source\vas\web\target\vas-webapp-1.0-SN
 APSHOT
 [INFO] Copy webapp webResources to C:\root\projects\full-source\vas\web\target\vas-webapp-1.0-SNAPSH
 OT
 [INFO] Generating war C:\root\projects\full-source\vas\web\target\vas-webapp-1.0-SNAPSHOT.war
 [INFO] Building war: C:\root\projects\full-source\vas\web\target\vas-webapp-1.0-SNAPSHOT.war
 [INFO] [cargo:start {execution: start-container}]
 [INFO] [stalledLocalDeployer] Deploying [C:\root\projects\full-source\vas\web\target\vas-webapp-1.0-
 SNAPSHOT.war] to [C:\root\projects\full-source\vas\web\target/tomcat5x/container/webapps]...
 [INFO] [talledLocalContainer] Tomcat 5.x starting...
 [INFO] [talledLocalContainer] 03-Oct-2007 12:32:39 org.apache.coyote.http11.Http11Protocol init
 [INFO] [talledLocalContainer] INFO: Initializing Coyote HTTP/1.1 on http-8081
 [INFO] [talledLocalContainer] 03-Oct-2007 12:32:39 org.apache.catalina.startup.Catalina load
 [INFO] [talledLocalContainer] INFO: Initialization processed in 610 ms
 [INFO] [talledLocalContainer] 03-Oct-2007 12:32:40 org.apache.catalina.core.StandardService start
 [INFO] [talledLocalContainer] INFO: Starting service Catalina
 [INFO] [talledLocalContainer] 03-Oct-2007 12:32:40 org.apache.catalina.core.StandardEngine start
 [INFO] [talledLocalContainer] INFO: Starting Servlet Engine: Apache Tomcat/6.0.14
 [INFO] [talledLocalContainer] 03-Oct-2007 12:32:50 org.apache.catalina.core.ApplicationContext log
 [INFO] [talledLocalContainer] INFO: Initializing Spring root WebApplicationContext
 [INFO] [talledLocalContainer] WARN [main] DefaultNamespaceHandlerResolver.initHandlerMappings(133) |
  Ignoring namespace handler [org.springmodules.validation.bean.conf.namespace.ValidatorNamespaceHand
 ler]: problem with handler class file or dependent class
 [INFO] [talledLocalContainer] java.lang.NoSuchFieldError: IS_JAVA_1_6
 [INFO] [talledLocalContainer] at org.springmodules.validation.util.LibraryUtils.<clinit>(LibraryUt
 ils.java:40)
 [INFO] [talledLocalContainer] at org.springmodules.validation.bean.conf.namespace.ValidatorNamespa
 ceHandler.init(ValidatorNamespaceHandler.java:51)
 [INFO] [talledLocalContainer] at org.springframework.beans.factory.xml.DefaultNamespaceHandlerReso
 lver.initHandlerMappings(DefaultNamespaceHandlerResolver.java:123)
 [INFO] [talledLocalContainer] at org.springframework.beans.factory.xml.DefaultNamespaceHandlerReso
 lver.<init>(DefaultNamespaceHandlerResolver.java:96)
 [INFO] [talledLocalContainer] at org.springframework.beans.factory.xml.DefaultNamespaceHandlerReso
 lver.<init>(DefaultNamespaceHandlerResolver.java:82)
 [INFO] [talledLocalContainer] at org.springframework.beans.factory.xml.XmlBeanDefinitionReader.cre
 ateDefaultNamespaceHandlerResolver(XmlBeanDefinitionReader.java:488)
 [INFO] [talledLocalContainer] at org.springframework.beans.factory.xml.XmlBeanDefinitionReader.cre
 ateReaderContext(XmlBeanDefinitionReader.java:477)
 [INFO] [talledLocalContainer] at org.springframework.beans.factory.xml.XmlBeanDefinitionReader.reg
 isterBeanDefinitions(XmlBeanDefinitionReader.java:458)
 [INFO] [talledLocalContainer] at org.springframework.beans.factory.xml.XmlBeanDefinitionReader.doL
 oadBeanDefinitions(XmlBeanDefinitionReader.java:353)
 [INFO] [talledLocalContainer] at org.springframework.beans.factory.xml.XmlBeanDefinitionReader.loa
 dBeanDefinitions(XmlBeanDefinitionReader.java:303)
 [INFO] [talledLocalContainer] at org.springframework.beans.factory.xml.XmlBeanDefinitionReader.loa
 dBeanDefinitions(XmlBeanDefinitionReader.java:280)
 [INFO] [talledLocalContainer] at org.springframework.beans.factory.support.AbstractBeanDefinitionR
 eader.loadBeanDefinitions(AbstractBeanDefinitionReader.java:131)
 [INFO] [talledLocalContainer] at org.springframework.beans.factory.support.AbstractBeanDefinitionR
 eader.loadBeanDefinitions(AbstractBeanDefinitionReader.java:147)
 [INFO] [talledLocalContainer] at org.springframework.web.context.support.XmlWebApplicationContext.
 loadBeanDefinitions(XmlWebApplicationContext.java:124)
 [INFO] [talledLocalContainer] at org.springframework.web.context.support.XmlWebApplicationContext.
 loadBeanDefinitions(XmlWebApplicationContext.java:92)
 [INFO] [talledLocalContainer] at org.springframework.context.support.AbstractRefreshableApplicatio
 nContext.refreshBeanFactory(AbstractRefreshableApplicationContext.java:101)
 [INFO] [talledLocalContainer] at org.springframework.context.support.AbstractApplicationContext.ob
 tainFreshBeanFactory(AbstractApplicationContext.java:389)
 [INFO] [talledLocalContainer] at org.springframework.context.support.AbstractApplicationContext.re
 fresh(AbstractApplicationContext.java:324)
 [INFO] [talledLocalContainer] at org.springframework.web.context.ContextLoader.createWebApplicatio
 nContext(ContextLoader.java:244)
 [INFO] [talledLocalContainer] at org.springframework.web.context.ContextLoader.initWebApplicationC
 ontext(ContextLoader.java:187)
 [INFO] [talledLocalContainer] at org.springframework.web.context.ContextLoaderListener.contextInit
 ialized(ContextLoaderListener.java:49)
 [INFO] [talledLocalContainer] at org.apache.catalina.core.StandardContext.listenerStart(StandardCo
 ntext.java:3830)
 [INFO] [talledLocalContainer] at org.apache.catalina.core.StandardContext.start(StandardContext.ja
 va:4337)
 [INFO] [talledLocalContainer] at org.apache.catalina.core.ContainerBase.start(ContainerBase.java:1
 045)
 [INFO] [talledLocalContainer] at org.apache.catalina.core.StandardHost.start(StandardHost.java:719
 )
 [INFO] [talledLocalContainer] at org.apache.catalina.core.ContainerBase.start(ContainerBase.java:1
 045)
 [INFO] [talledLocalContainer] at org.apache.catalina.core.StandardEngine.start(StandardEngine.java
 :443)
 [INFO] [talledLocalContainer] at org.apache.catalina.core.StandardService.start(StandardService.ja
 va:516)
 [INFO] [talledLocalContainer] at org.apache.catalina.core.StandardServer.start(StandardServer.java
 :710)
 [INFO] [talledLocalContainer] at org.apache.catalina.startup.Catalina.start(Catalina.java:566)
 [INFO] [talledLocalContainer] at sun.reflect.NativeMethodAccessorImpl.invoke0(Native Method)
 [INFO] [talledLocalContainer] at sun.reflect.NativeMethodAccessorImpl.invoke(NativeMethodAccessorI
 mpl.java:39)
 [INFO] [talledLocalContainer] at sun.reflect.DelegatingMethodAccessorImpl.invoke(DelegatingMethodA
 ccessorImpl.java:25)
 [INFO] [talledLocalContainer] at java.lang.reflect.Method.invoke(Method.java:597)
 [INFO] [talledLocalContainer] at org.apache.catalina.startup.Bootstrap.start(Bootstrap.java:288)
 [INFO] [talledLocalContainer] at org.apache.catalina.startup.Bootstrap.main(Bootstrap.java:413)
 [INFO] [talledLocalContainer] DEBUG [main] StartupListener.contextInitialized(37) | initializing con
 text...
 [INFO] [talledLocalContainer] DEBUG [main] StartupListener.contextInitialized(84) | Remember Me Enab
 led? true
 [INFO] [talledLocalContainer] DEBUG [main] StartupListener.contextInitialized(85) | Encrypt Password
 s? true
 [INFO] [talledLocalContainer] DEBUG [main] StartupListener.contextInitialized(87) | Encryption Algor
 ithm: SHA
 [INFO] [talledLocalContainer] DEBUG [main] StartupListener.contextInitialized(89) | Populating drop-
 downs...
 [INFO] [talledLocalContainer] DEBUG [main] LookupDaoJpa.getRoles(20) | retrieving all role names...
 [INFO] [talledLocalContainer] DEBUG [main] StartupListener.setupContext(105) | Drop-down initializat
 ion complete [OK]
 [INFO] [talledLocalContainer] DEBUG [main] LocaleFilter.init(158) | Initializing filter 'localeFilte
 r'
 [INFO] [talledLocalContainer] DEBUG [main] LocaleFilter.init(183) | Filter 'localeFilter' configured
  successfully
 [INFO] [talledLocalContainer] 03-Oct-2007 12:32:56 org.apache.catalina.core.ApplicationContext log
 [INFO] [talledLocalContainer] INFO: Initializing Spring FrameworkServlet 'dispatcher'
 [INFO] [talledLocalContainer] WARN [main] DefaultNamespaceHandlerResolver.initHandlerMappings(133) |
  Ignoring namespace handler [org.springmodules.validation.bean.conf.namespace.ValidatorNamespaceHand
 ler]: problem with handler class file or dependent class
 [INFO] [talledLocalContainer] java.lang.NoClassDefFoundError: Could not initialize class org.springm
 odules.validation.util.LibraryUtils
 [INFO] [talledLocalContainer] at org.springmodules.validation.bean.conf.namespace.ValidatorNamespa
 ceHandler.init(ValidatorNamespaceHandler.java:51)
 [INFO] [talledLocalContainer] at org.springframework.beans.factory.xml.DefaultNamespaceHandlerReso
 lver.initHandlerMappings(DefaultNamespaceHandlerResolver.java:123)
 [INFO] [talledLocalContainer] at org.springframework.beans.factory.xml.DefaultNamespaceHandlerReso
 lver.<init>(DefaultNamespaceHandlerResolver.java:96)
 [INFO] [talledLocalContainer] at org.springframework.beans.factory.xml.DefaultNamespaceHandlerReso
 lver.<init>(DefaultNamespaceHandlerResolver.java:82)
 [INFO] [talledLocalContainer] at org.springframework.beans.factory.xml.XmlBeanDefinitionReader.cre
 ateDefaultNamespaceHandlerResolver(XmlBeanDefinitionReader.java:488)
 [INFO] [talledLocalContainer] at org.springframework.beans.factory.xml.XmlBeanDefinitionReader.cre
 ateReaderContext(XmlBeanDefinitionReader.java:477)
 [INFO] [talledLocalContainer] at org.springframework.beans.factory.xml.XmlBeanDefinitionReader.reg
 isterBeanDefinitions(XmlBeanDefinitionReader.java:458)
 [INFO] [talledLocalContainer] at org.springframework.beans.factory.xml.XmlBeanDefinitionReader.doL
 oadBeanDefinitions(XmlBeanDefinitionReader.java:353)
 [INFO] [talledLocalContainer] at org.springframework.beans.factory.xml.XmlBeanDefinitionReader.loa
 dBeanDefinitions(XmlBeanDefinitionReader.java:303)
 [INFO] [talledLocalContainer] at org.springframework.beans.factory.xml.XmlBeanDefinitionReader.loa
 dBeanDefinitions(XmlBeanDefinitionReader.java:280)
 [INFO] [talledLocalContainer] at org.springframework.beans.factory.support.AbstractBeanDefinitionR
 eader.loadBeanDefinitions(AbstractBeanDefinitionReader.java:131)
 [INFO] [talledLocalContainer] at org.springframework.beans.factory.support.AbstractBeanDefinitionR
 eader.loadBeanDefinitions(AbstractBeanDefinitionReader.java:147)
 [INFO] [talledLocalContainer] at org.springframework.web.context.support.XmlWebApplicationContext.
 loadBeanDefinitions(XmlWebApplicationContext.java:124)
 [INFO] [talledLocalContainer] at org.springframework.web.context.support.XmlWebApplicationContext.
 loadBeanDefinitions(XmlWebApplicationContext.java:92)
 [INFO] [talledLocalContainer] at org.springframework.context.support.AbstractRefreshableApplicatio
 nContext.refreshBeanFactory(AbstractRefreshableApplicationContext.java:101)
 [INFO] [talledLocalContainer] at org.springframework.context.support.AbstractApplicationContext.ob
 tainFreshBeanFactory(AbstractApplicationContext.java:389)
 [INFO] [talledLocalContainer] at org.springframework.context.support.AbstractApplicationContext.re
 fresh(AbstractApplicationContext.java:324)
 [INFO] [talledLocalContainer] at org.springframework.web.servlet.FrameworkServlet.createWebApplica
 tionContext(FrameworkServlet.java:331)
 [INFO] [talledLocalContainer] at org.springframework.web.servlet.FrameworkServlet.initWebApplicati
 onContext(FrameworkServlet.java:265)
 [INFO] [talledLocalContainer] at org.springframework.web.servlet.FrameworkServlet.initServletBean(
 FrameworkServlet.java:235)
 [INFO] [talledLocalContainer] at org.springframework.web.servlet.HttpServletBean.init(HttpServletB
 ean.java:126)
 [INFO] [talledLocalContainer] at javax.servlet.GenericServlet.init(GenericServlet.java:212)
 [INFO] [talledLocalContainer] at org.apache.catalina.core.StandardWrapper.loadServlet(StandardWrap
 per.java:1161)
 [INFO] [talledLocalContainer] at org.apache.catalina.core.StandardWrapper.load(StandardWrapper.jav
 a:981)
 [INFO] [talledLocalContainer] at org.apache.catalina.core.StandardContext.loadOnStartup(StandardCo
 ntext.java:4045)
 [INFO] [talledLocalContainer] at org.apache.catalina.core.StandardContext.start(StandardContext.ja
 va:4351)
 [INFO] [talledLocalContainer] at org.apache.catalina.core.ContainerBase.start(ContainerBase.java:1
 045)
 [INFO] [talledLocalContainer] at org.apache.catalina.core.StandardHost.start(StandardHost.java:719
 )
 [INFO] [talledLocalContainer] at org.apache.catalina.core.ContainerBase.start(ContainerBase.java:1
 045)
 [INFO] [talledLocalContainer] at org.apache.catalina.core.StandardEngine.start(StandardEngine.java
 :443)
 [INFO] [talledLocalContainer] at org.apache.catalina.core.StandardService.start(StandardService.ja
 va:516)
 [INFO] [talledLocalContainer] at org.apache.catalina.core.StandardServer.start(StandardServer.java
 :710)
 [INFO] [talledLocalContainer] at org.apache.catalina.startup.Catalina.start(Catalina.java:566)
 [INFO] [talledLocalContainer] at sun.reflect.NativeMethodAccessorImpl.invoke0(Native Method)
 [INFO] [talledLocalContainer] at sun.reflect.NativeMethodAccessorImpl.invoke(NativeMethodAccessorI
 mpl.java:39)
 [INFO] [talledLocalContainer] at sun.reflect.DelegatingMethodAccessorImpl.invoke(DelegatingMethodA
 ccessorImpl.java:25)
 [INFO] [talledLocalContainer] at java.lang.reflect.Method.invoke(Method.java:597)
 [INFO] [talledLocalContainer] at org.apache.catalina.startup.Bootstrap.start(Bootstrap.java:288)
 [INFO] [talledLocalContainer] at org.apache.catalina.startup.Bootstrap.main(Bootstrap.java:413)
 [INFO] [talledLocalContainer] 03-Oct-2007 12:32:58 org.apache.catalina.startup.HostConfig deployWAR
 [INFO] [talledLocalContainer] INFO: Deploying web application archive cargocpc.war
 [INFO] [talledLocalContainer] 03-Oct-2007 12:32:58 org.apache.coyote.http11.Http11Protocol start
 [INFO] [talledLocalContainer] INFO: Starting Coyote HTTP/1.1 on http-8081
 [INFO] [talledLocalContainer] 03-Oct-2007 12:32:58 org.apache.catalina.startup.Catalina start
 [INFO] [talledLocalContainer] INFO: Server startup in 18160 ms
 [INFO] [talledLocalContainer] Tomcat 5.x started on port [8081]
 [INFO] [antrun:run {execution: default}]
 [INFO] Executing tasks
     [mkdir] Created dir: C:\root\projects\full-source\vas\web\target\webtest-data
      [echo] Testing 'vas-webapp-1.0-SNAPSHOT' with locale 'en'
 
 Login:
 
 Logout:
 
 PasswordHint:
 [INFO] [talledLocalContainer] DEBUG [http-8081-3] PasswordHintController.handleRequest(55) | enterin
 g 'handleRequest' method...
 [INFO] [talledLocalContainer] DEBUG [http-8081-3] PasswordHintController.handleRequest(69) | Process
 ing Password Hint...
 [INFO] [talledLocalContainer] ERROR [http-8081-3] MailEngine.send(71) | Mail server connection faile
 d; nested exception is javax.mail.MessagingException: Could not connect to SMTP host: localhost, por
 t: 25;
 [INFO] [talledLocalContainer] nested exception is:
 [INFO] [talledLocalContainer] java.net.ConnectException: Connection refused: connect
 
 Signup:
 [INFO] [talledLocalContainer] DEBUG [http-8081-4] SignupController.showNewForm(322) | Displaying new
  form
 [INFO] [talledLocalContainer] DEBUG [http-8081-4] SignupController.createCommand(340) | Creating new
  command of class [com.tango.vas.model.User]
 [INFO] [talledLocalContainer] WARN [http-8081-4] ValidatorResources.getForm(448) | Form 'null' not f
 ound for locale 'en'
 [INFO] [talledLocalContainer] DEBUG [http-8081-4] SignupController.createCommand(340) | Creating new
  command of class [com.tango.vas.model.User]
 [INFO] [talledLocalContainer] DEBUG [http-8081-4] SignupController.processFormSubmission(266) | No e
 rrors -> processing submit
 [INFO] [talledLocalContainer] DEBUG [http-8081-4] SignupController.onSubmit(40) | entering 'onSubmit
 ' method...
 [INFO] [talledLocalContainer] DEBUG [http-8081-4] UserSecurityAdvice.before(98) | Registering new us
 er 'signup-user'
 [INFO] [talledLocalContainer] DEBUG [http-8081-4] SignupController.onSubmit(91) | Sending user 'sign
 up-user' an account information e-mail
 [INFO] [talledLocalContainer] DEBUG [http-8081-4] SignupController.sendUserMessage(169) | sending e-
 mail to user [signup-user@raibledesigns.com]...
 [INFO] [talledLocalContainer] WARN [http-8081-4] VelocityEngine.logVelocityMessage(46) | org.apache.
 velocity.runtime.exception.ReferenceException: reference : template = accountCreated.vm [line 4,colu
 mn 11] : ${user.confirmPassword} is not a valid reference.
 [INFO] [talledLocalContainer] ERROR [http-8081-4] MailEngine.send(71) | Mail server connection faile
 d; nested exception is javax.mail.MessagingException: Could not connect to SMTP host: localhost, por
 t: 25;
 [INFO] [talledLocalContainer] nested exception is:
 [INFO] [talledLocalContainer] java.net.ConnectException: Connection refused: connect
 
 StaticPages:
 
 EditUser:
 [INFO] [talledLocalContainer] DEBUG [http-8081-6] UserFormController.showNewForm(322) | Displaying n
 ew form
 [INFO] [talledLocalContainer] DEBUG [http-8081-6] UserFormController.formBackingObject(174) | checki
 ng for remember me login...
 [INFO] [talledLocalContainer] WARN [http-8081-6] ValidatorResources.getForm(448) | Form 'null' not f
 ound for locale 'en'
 
 SearchUser:
 [INFO] [talledLocalContainer] DEBUG [http-8081-7] UserController.handleRequest(38) | entering 'handl
 eRequest' method...
 [INFO] ------------------------------------------------------------------------
 [ERROR] BUILD ERROR
 [INFO] ------------------------------------------------------------------------
 [INFO] Error executing ant tasks
 
 Embedded error: The following error occurred while executing this line:
 C:\root\projects\full-source\vas\web\src\test\resources\web-tests.xml:88: Step[invoke "click View Us
 ers link" (7/8)]: HTTP error 500, at: invoke
 [INFO] ------------------------------------------------------------------------
 [INFO] For more information, run Maven with the -e switch
 [INFO] ------------------------------------------------------------------------
 [INFO] Total time: 1 minute 47 seconds
 [INFO] Finished at: Wed Oct 03 12:33:16 BST 2007
 [INFO] Final Memory: 36M/63M
 [INFO] ------------------------------------------------------------------------

 
 Declan Cox@MINDSTORM /cygdrive/c/root/projects/full-source/vas $
 
 
 
 
 On running the application in jetty, logging in and clicking a few of the Admin menu options all but
 View Users and Current Users seem to work. The latter two render blank pages even though the correct
 handlers are called (this can be seen from the logging output in the trace below).
 
 Declan Cox@MINDSTORM /cygdrive/c/root/projects/full-source/vas/web
 $ mvn jetty:run-war -Dmaven.test.skip=true
 [INFO] Scanning for projects...
 [INFO] Searching repository for plugin with prefix: 'jetty'.
 [INFO] ----------------------------------------------------------------------------
 [INFO] Building AppFuse Modular Application - Web (Spring MVC)
 [INFO] task-segment: [jetty:run-war]
 [INFO] ----------------------------------------------------------------------------
 [INFO] Preparing jetty:run-war
 [INFO] [native2ascii:native2ascii {execution: native2ascii-utf8}]
 [INFO] [native2ascii:native2ascii {execution: native2ascii-8859_1}]
 [INFO] [resources:resources]
 [INFO] Using default encoding to copy filtered resources.
 [INFO] snapshot com.tango.vas:vas-core:1.0-SNAPSHOT: checking for updates from ibiblio
 [INFO] snapshot com.tango.vas:vas-core:1.0-SNAPSHOT: checking for updates from mvnrepository
 [INFO] snapshot com.tango.vas:vas-core:1.0-SNAPSHOT: checking for updates from java.net
 [INFO] snapshot com.tango.vas:vas-core:1.0-SNAPSHOT: checking for updates from Maven Snapshots
 [INFO] snapshot com.tango.vas:vas-core:1.0-SNAPSHOT: checking for updates from Codehaus Repository
 [INFO] snapshot com.tango.vas:vas-core:1.0-SNAPSHOT: checking for updates from central
 [INFO] snapshot com.tango.vas:vas-core:1.0-SNAPSHOT: checking for updates from appfuse
 [INFO] [compiler:compile]
 [INFO] Compiling 1 source file to c:\root\projects\full-source\vas\web\target\classes
 [INFO] [resources:testResources]
 [INFO] Using default encoding to copy filtered resources.
 [INFO] [compiler:testCompile]
 [INFO] Not compiling test sources
 [INFO] [dbunit:operation {execution: test-compile}]
 [INFO] Skip operation: CLEAN_INSERT execution
 [INFO] [surefire:test]
 [INFO] Tests are skipped.
 [INFO] [dbunit:operation {execution: test}]
 [INFO] Skip operation: CLEAN_INSERT execution
 [INFO] [war:war]
 [INFO] Exploding webapp...
 [INFO] Assembling webapp vas-webapp in c:\root\projects\full-source\vas\web\target\vas-webapp-1.0-SN
 APSHOT
 [INFO] Copy webapp webResources to c:\root\projects\full-source\vas\web\target\vas-webapp-1.0-SNAPSH
 OT
 [INFO] Generating war c:\root\projects\full-source\vas\web\target\vas-webapp-1.0-SNAPSHOT.war
 [INFO] Building war: c:\root\projects\full-source\vas\web\target\vas-webapp-1.0-SNAPSHOT.war
 [INFO] [jetty:run-war]
 [INFO] Configuring Jetty for project: AppFuse Modular Application - Web (Spring MVC)
 2007-10-03 12:08:06.816::INFO: Logging to STDERR via org.mortbay.log.StdErrLog
 [INFO] Context path = /
 [INFO] Tmp directory = c:\root\projects\full-source\vas\web\target\work
 [INFO] Web defaults = jetty default
 [INFO] Web overrides = none
 [INFO] Starting jetty 6.1.5 ...
 2007-10-03 12:08:06.066::INFO: jetty-6.1.5
 2007-10-03 12:08:06.191::INFO: Extract jar:file:/C:/root/projects/full-source/vas/web/target/vas-we
 bapp-1.0-SNAPSHOT.war!/ to C:\root\projects\full-source\vas\web\target\work\webapp
 2007-10-03 12:08:21.807::INFO: No Transaction manager found - if your webapp requires one, please c
 onfigure one.
 2007-10-03 12:08:21.042:/:INFO: Initializing Spring root WebApplicationContext
 WARN [main] DefaultNamespaceHandlerResolver.initHandlerMappings(133) | Ignoring namespace handler [o
 rg.springmodules.validation.bean.conf.namespace.ValidatorNamespaceHandler]: problem with handler cla
 ss file or dependent class
 java.lang.NoSuchFieldError: IS_JAVA_1_6
         at org.springmodules.validation.util.LibraryUtils.<clinit>(LibraryUtils.java:40)
         at org.springmodules.validation.bean.conf.namespace.ValidatorNamespaceHandler.init(Validator
 NamespaceHandler.java:51)
         at org.springframework.beans.factory.xml.DefaultNamespaceHandlerResolver.initHandlerMappings
 (DefaultNamespaceHandlerResolver.java:123)
         at org.springframework.beans.factory.xml.DefaultNamespaceHandlerResolver.<init>(DefaultNames
 paceHandlerResolver.java:96)
         at org.springframework.beans.factory.xml.DefaultNamespaceHandlerResolver.<init>(DefaultNames
 paceHandlerResolver.java:82)
         at org.springframework.beans.factory.xml.XmlBeanDefinitionReader.createDefaultNamespaceHandl
 erResolver(XmlBeanDefinitionReader.java:488)
         at org.springframework.beans.factory.xml.XmlBeanDefinitionReader.createReaderContext(XmlBean
 DefinitionReader.java:477)
         at org.springframework.beans.factory.xml.XmlBeanDefinitionReader.registerBeanDefinitions(Xml
 BeanDefinitionReader.java:458)
         at org.springframework.beans.factory.xml.XmlBeanDefinitionReader.doLoadBeanDefinitions(XmlBe
 anDefinitionReader.java:353)
         at org.springframework.beans.factory.xml.XmlBeanDefinitionReader.loadBeanDefinitions(XmlBean
 DefinitionReader.java:303)
         at org.springframework.beans.factory.xml.XmlBeanDefinitionReader.loadBeanDefinitions(XmlBean
 DefinitionReader.java:280)
         at org.springframework.beans.factory.support.AbstractBeanDefinitionReader.loadBeanDefinition
 s(AbstractBeanDefinitionReader.java:131)
         at org.springframework.beans.factory.support.AbstractBeanDefinitionReader.loadBeanDefinition
 s(AbstractBeanDefinitionReader.java:147)
         at org.springframework.web.context.support.XmlWebApplicationContext.loadBeanDefinitions(XmlW
 ebApplicationContext.java:124)
         at org.springframework.web.context.support.XmlWebApplicationContext.loadBeanDefinitions(XmlW
 ebApplicationContext.java:92)
         at org.springframework.context.support.AbstractRefreshableApplicationContext.refreshBeanFact
 ory(AbstractRefreshableApplicationContext.java:101)
         at org.springframework.context.support.AbstractApplicationContext.obtainFreshBeanFactory(Abs
 tractApplicationContext.java:389)
         at org.springframework.context.support.AbstractApplicationContext.refresh(AbstractApplicatio
 nContext.java:324)
         at org.springframework.web.context.ContextLoader.createWebApplicationContext(ContextLoader.j
 ava:244)
         at org.springframework.web.context.ContextLoader.initWebApplicationContext(ContextLoader.jav
 a:187)
         at org.springframework.web.context.ContextLoaderListener.contextInitialized(ContextLoaderLis
 tener.java:49)
         at org.mortbay.jetty.handler.ContextHandler.startContext(ContextHandler.java:530)
         at org.mortbay.jetty.servlet.Context.startContext(Context.java:135)
         at org.mortbay.jetty.webapp.WebAppContext.startContext(WebAppContext.java:1218)
         at org.mortbay.jetty.handler.ContextHandler.doStart(ContextHandler.java:500)
         at org.mortbay.jetty.webapp.WebAppContext.doStart(WebAppContext.java:448)
         at org.mortbay.component.AbstractLifeCycle.start(AbstractLifeCycle.java:40)
         at org.mortbay.jetty.handler.HandlerCollection.doStart(HandlerCollection.java:147)
         at org.mortbay.jetty.handler.ContextHandlerCollection.doStart(ContextHandlerCollection.java:
 161)
         at org.mortbay.component.AbstractLifeCycle.start(AbstractLifeCycle.java:40)
         at org.mortbay.jetty.handler.HandlerCollection.doStart(HandlerCollection.java:147)
         at org.mortbay.component.AbstractLifeCycle.start(AbstractLifeCycle.java:40)
         at org.mortbay.jetty.handler.HandlerWrapper.doStart(HandlerWrapper.java:117)
         at org.mortbay.jetty.Server.doStart(Server.java:217)
         at org.mortbay.component.AbstractLifeCycle.start(AbstractLifeCycle.java:40)
         at org.mortbay.jetty.plugin.Jetty6PluginServer.start(Jetty6PluginServer.java:132)
         at org.mortbay.jetty.plugin.AbstractJettyMojo.startJetty(AbstractJettyMojo.java:345)
         at org.mortbay.jetty.plugin.AbstractJettyMojo.execute(AbstractJettyMojo.java:286)
         at org.mortbay.jetty.plugin.Jetty6RunWar.execute(Jetty6RunWar.java:67)
         at org.apache.maven.plugin.DefaultPluginManager.executeMojo(DefaultPluginManager.java:443)
         at org.apache.maven.lifecycle.DefaultLifecycleExecutor.executeGoals(DefaultLifecycleExecutor
 .java:539)
         at org.apache.maven.lifecycle.DefaultLifecycleExecutor.executeStandaloneGoal(DefaultLifecycl
 eExecutor.java:493)
         at org.apache.maven.lifecycle.DefaultLifecycleExecutor.executeGoal(DefaultLifecycleExecutor.
 java:463)
         at org.apache.maven.lifecycle.DefaultLifecycleExecutor.executeGoalAndHandleFailures(DefaultL
 ifecycleExecutor.java:311)
         at org.apache.maven.lifecycle.DefaultLifecycleExecutor.executeTaskSegments(DefaultLifecycleE
 xecutor.java:278)
         at org.apache.maven.lifecycle.DefaultLifecycleExecutor.execute(DefaultLifecycleExecutor.java
 :143)
         at org.apache.maven.DefaultMaven.doExecute(DefaultMaven.java:334)
         at org.apache.maven.DefaultMaven.execute(DefaultMaven.java:125)
         at org.apache.maven.cli.MavenCli.main(MavenCli.java:280)
         at sun.reflect.NativeMethodAccessorImpl.invoke0(Native Method)
         at sun.reflect.NativeMethodAccessorImpl.invoke(NativeMethodAccessorImpl.java:39)
         at sun.reflect.DelegatingMethodAccessorImpl.invoke(DelegatingMethodAccessorImpl.java:25)
         at java.lang.reflect.Method.invoke(Method.java:597)
         at org.codehaus.classworlds.Launcher.launchEnhanced(Launcher.java:315)
         at org.codehaus.classworlds.Launcher.launch(Launcher.java:255)
         at org.codehaus.classworlds.Launcher.mainWithExitCode(Launcher.java:430)
         at org.codehaus.classworlds.Launcher.main(Launcher.java:375)
 DEBUG [main] StartupListener.contextInitialized(37) | initializing context...
 DEBUG [main] StartupListener.contextInitialized(84) | Remember Me Enabled? true
 DEBUG [main] StartupListener.contextInitialized(85) | Encrypt Passwords? true
 DEBUG [main] StartupListener.contextInitialized(87) | Encryption Algorithm: SHA
 DEBUG [main] StartupListener.contextInitialized(89) | Populating drop-downs...
 DEBUG [main] LookupDaoJpa.getRoles(20) | retrieving all role names...
 DEBUG [main] StartupListener.setupContext(105) | Drop-down initialization complete [OK]
 DEBUG [main] LocaleFilter.init(158) | Initializing filter 'localeFilter'
 DEBUG [main] LocaleFilter.init(183) | Filter 'localeFilter' configured successfully
 2007-10-03 12:08:27.571:/:INFO: Initializing Spring FrameworkServlet 'dispatcher'
 WARN [main] DefaultNamespaceHandlerResolver.initHandlerMappings(133) | Ignoring namespace handler [o
 rg.springmodules.validation.bean.conf.namespace.ValidatorNamespaceHandler]: problem with handler cla
 ss file or dependent class
 java.lang.NoClassDefFoundError: Could not initialize class org.springmodules.validation.util.Library
 Utils
         at org.springmodules.validation.bean.conf.namespace.ValidatorNamespaceHandler.init(Validator
 NamespaceHandler.java:51)
         at org.springframework.beans.factory.xml.DefaultNamespaceHandlerResolver.initHandlerMappings
 (DefaultNamespaceHandlerResolver.java:123)
         at org.springframework.beans.factory.xml.DefaultNamespaceHandlerResolver.<init>(DefaultNames
 paceHandlerResolver.java:96)
         at org.springframework.beans.factory.xml.DefaultNamespaceHandlerResolver.<init>(DefaultNames
 paceHandlerResolver.java:82)
         at org.springframework.beans.factory.xml.XmlBeanDefinitionReader.createDefaultNamespaceHandl
 erResolver(XmlBeanDefinitionReader.java:488)
         at org.springframework.beans.factory.xml.XmlBeanDefinitionReader.createReaderContext(XmlBean
 DefinitionReader.java:477)
         at org.springframework.beans.factory.xml.XmlBeanDefinitionReader.registerBeanDefinitions(Xml
 BeanDefinitionReader.java:458)
         at org.springframework.beans.factory.xml.XmlBeanDefinitionReader.doLoadBeanDefinitions(XmlBe
 anDefinitionReader.java:353)
         at org.springframework.beans.factory.xml.XmlBeanDefinitionReader.loadBeanDefinitions(XmlBean
 DefinitionReader.java:303)
         at org.springframework.beans.factory.xml.XmlBeanDefinitionReader.loadBeanDefinitions(XmlBean
 DefinitionReader.java:280)
         at org.springframework.beans.factory.support.AbstractBeanDefinitionReader.loadBeanDefinition
 s(AbstractBeanDefinitionReader.java:131)
         at org.springframework.beans.factory.support.AbstractBeanDefinitionReader.loadBeanDefinition
 s(AbstractBeanDefinitionReader.java:147)
         at org.springframework.web.context.support.XmlWebApplicationContext.loadBeanDefinitions(XmlW
 ebApplicationContext.java:124)
         at org.springframework.web.context.support.XmlWebApplicationContext.loadBeanDefinitions(XmlW
 ebApplicationContext.java:92)
         at org.springframework.context.support.AbstractRefreshableApplicationContext.refreshBeanFact
 ory(AbstractRefreshableApplicationContext.java:101)
         at org.springframework.context.support.AbstractApplicationContext.obtainFreshBeanFactory(Abs
 tractApplicationContext.java:389)
       &nbs