Skip to content

Instantly share code, notes, and snippets.

@felipegutierrez

felipegutierrez/catalina.out

Created June 7, 2017 13:38
Show Gist options
  • Save felipegutierrez/618d4d08d351aadb6a0b16d437d6ba2f to your computer and use it in GitHub Desktop.
Save felipegutierrez/618d4d08d351aadb6a0b16d437d6ba2f to your computer and use it in GitHub Desktop.
Download ZIP
Raw
catalina.out
```
2017-06-07 09:21:46 DEBUG SyncJobs:75 - Starting synchronization job...
2017-06-07 09:21:46 DEBUG IRODSAccessObjectFactoryImpl:230 - creating access object factory
2017-06-07 09:21:46 DEBUG IRODSGenericAO:64 - establishing connection
2017-06-07 09:21:46 DEBUG IRODSSession:418 - session using previously established connection:AbstractIRODSMidLevelProtocol [irodsConnection=IRODSBasicTCPConnection [], irodsProtocolManager=org.irods.jargon.core.connection.IRODSSimpleProtocolManager@55ec6d47, irodsServerProperties=org.irods.jargon.core.connection.IRODSServerProperties@5b9a98e3, irodsSession=org.irods.jargon.core.connection.IRODSSession@7a65857, startupResponseData=StartupResponseData:
status:0
relVersion:rods4.1.10
apiVersion:d
reconnPort:0
reconnAddr:
cookie:400, forceSslFlush=false, log=org.slf4j.impl.Log4jLoggerAdapter(org.irods.jargon.core.connection.AbstractIRODSMidLevelProtocol), authResponse=AuthResponse [successful=true, authMessage=, authenticatingIRODSAccount=irods://rods@irodsprodvm.ebioscience.amc.nl:1247, authenticatedIRODSAccount=irods://rods@irodsprodvm.ebioscience.amc.nl:1247, responseProperties=[], startupResponse=StartupResponseData:
status:0
relVersion:rods4.1.10
apiVersion:d
reconnPort:0
reconnAddr:
cookie:400], irodsAccount=irods://rods@irodsprodvm.ebioscience.amc.nl:1247]
2017-06-07 09:21:46 DEBUG IRODSAccessObjectFactoryImpl:230 - creating access object factory
2017-06-07 09:21:46 DEBUG IRODSAccessObjectFactoryImpl:230 - creating access object factory
2017-06-07 09:21:46 DEBUG IRODSGenericAO:64 - establishing connection
2017-06-07 09:21:46 DEBUG IRODSSession:418 - session using previously established connection:AbstractIRODSMidLevelProtocol [irodsConnection=IRODSBasicTCPConnection [], irodsProtocolManager=org.irods.jargon.core.connection.IRODSSimpleProtocolManager@55ec6d47, irodsServerProperties=org.irods.jargon.core.connection.IRODSServerProperties@5b9a98e3, irodsSession=org.irods.jargon.core.connection.IRODSSession@7a65857, startupResponseData=StartupResponseData:
status:0
relVersion:rods4.1.10
apiVersion:d
reconnPort:0
reconnAddr:
cookie:400, forceSslFlush=false, log=org.slf4j.impl.Log4jLoggerAdapter(org.irods.jargon.core.connection.AbstractIRODSMidLevelProtocol), authResponse=AuthResponse [successful=true, authMessage=, authenticatingIRODSAccount=irods://rods@irodsprodvm.ebioscience.amc.nl:1247, authenticatedIRODSAccount=irods://rods@irodsprodvm.ebioscience.amc.nl:1247, responseProperties=[], startupResponse=StartupResponseData:
status:0
relVersion:rods4.1.10
apiVersion:d
reconnPort:0
reconnAddr:
cookie:400], irodsAccount=irods://rods@irodsprodvm.ebioscience.amc.nl:1247]
2017-06-07 09:21:46 INFO IRODSGenQueryExecutorImpl:123 - executeIRODSQueryAndCloseResult()
2017-06-07 09:21:46 INFO IRODSGenQueryExecutorImpl:142 - executeIRODSQueryAndCloseResultInZone()
2017-06-07 09:21:46 INFO IRODSGenQueryExecutorImpl:152 - query: org.irods.jargon.core.query.IRODSGenQueryFromBuilder@2b5aa62c
2017-06-07 09:21:46 DEBUG IRODSSession:418 - session using previously established connection:AbstractIRODSMidLevelProtocol [irodsConnection=IRODSBasicTCPConnection [], irodsProtocolManager=org.irods.jargon.core.connection.IRODSSimpleProtocolManager@55ec6d47, irodsServerProperties=org.irods.jargon.core.connection.IRODSServerProperties@5b9a98e3, irodsSession=org.irods.jargon.core.connection.IRODSSession@7a65857, startupResponseData=StartupResponseData:
status:0
relVersion:rods4.1.10
apiVersion:d
reconnPort:0
reconnAddr:
cookie:400, forceSslFlush=false, log=org.slf4j.impl.Log4jLoggerAdapter(org.irods.jargon.core.connection.AbstractIRODSMidLevelProtocol), authResponse=AuthResponse [successful=true, authMessage=, authenticatingIRODSAccount=irods://rods@irodsprodvm.ebioscience.amc.nl:1247, authenticatedIRODSAccount=irods://rods@irodsprodvm.ebioscience.amc.nl:1247, responseProperties=[], startupResponse=StartupResponseData:
status:0
relVersion:rods4.1.10
apiVersion:d
reconnPort:0
reconnAddr:
cookie:400], irodsAccount=irods://rods@irodsprodvm.ebioscience.amc.nl:1247]
2017-06-07 09:21:46 DEBUG IRODSMidLevelProtocol:170 - calling irods function with byte array
2017-06-07 09:21:46 DEBUG IRODSMidLevelProtocol:173 - calling irods function with:<GenQueryInp_PI><maxRows>5000</maxRows>
<continueInx>0</continueInx>
<partialStartIndex>0</partialStartIndex>
<options>0</options>
<KeyValPair_PI><ssLen>0</ssLen>
</KeyValPair_PI>
<InxIvalPair_PI><iiLen>8</iiLen>
<inx>204</inx>
<inx>202</inx>
<inx>201</inx>
<inx>203</inx>
<inx>206</inx>
<inx>207</inx>
<inx>208</inx>
<inx>209</inx>
<ivalue>1024</ivalue>
<ivalue>1024</ivalue>
<ivalue>1</ivalue>
<ivalue>1</ivalue>
<ivalue>1</ivalue>
<ivalue>1</ivalue>
<ivalue>1</ivalue>
<ivalue>1</ivalue>
</InxIvalPair_PI>
<InxValPair_PI><isLen>0</isLen>
</InxValPair_PI>
</GenQueryInp_PI>
2017-06-07 09:21:46 DEBUG IRODSMidLevelProtocol:176 - api number is:702
2017-06-07 09:21:46 DEBUG AbstractIRODSMidLevelProtocol:706 - reading message from irods
2017-06-07 09:21:46 DEBUG AbstractConnection:673 - IRODSConnection.read, byte array size = 4
2017-06-07 09:21:46 DEBUG AbstractConnection:675 - offset = 0
2017-06-07 09:21:46 DEBUG AbstractConnection:676 - length = 4
2017-06-07 09:21:46 DEBUG AbstractConnection:673 - IRODSConnection.read, byte array size = 142
2017-06-07 09:21:46 DEBUG AbstractConnection:675 - offset = 0
2017-06-07 09:21:46 DEBUG AbstractConnection:676 - length = 142
2017-06-07 09:21:46 DEBUG AbstractIRODSMidLevelProtocol:716 - message length:7238
2017-06-07 09:21:46 DEBUG AbstractIRODSMidLevelProtocol:717 - error length:0
2017-06-07 09:21:46 DEBUG AbstractIRODSMidLevelProtocol:718 - bytesLength:0
2017-06-07 09:21:46 DEBUG AbstractIRODSMidLevelProtocol:719 - info value:0
2017-06-07 09:21:46 DEBUG AbstractIRODSMidLevelProtocol:731 - message length greater than zero
2017-06-07 09:21:46 DEBUG AbstractConnection:673 - IRODSConnection.read, byte array size = 7238
2017-06-07 09:21:46 DEBUG AbstractConnection:675 - offset = 0
2017-06-07 09:21:46 DEBUG AbstractConnection:676 - length = 7238
2017-06-07 09:21:46 INFO GenQueryProcessor:90 - continuation value: 0
2017-06-07 09:21:46 INFO GenQueryProcessor:101 - total records:0
2017-06-07 09:21:46 INFO QueryResultProcessingUtils:62 - rows returned from iRODS query: 19
2017-06-07 09:21:46 DEBUG QueryResultProcessingUtils:76 - is this the last record? true
2017-06-07 09:21:46 INFO GenQueryProcessor:125 - auto closing result set
2017-06-07 09:21:46 INFO GenQueryProcessor:156 - getting more results for query
2017-06-07 09:21:46 INFO GenQueryProcessor:162 - no results to close, ignore
2017-06-07 09:21:46 INFO UserAOHelper:129 - user built:User:
id:10019 name:ajongejan
userType:rodsuser
userDn:
zone:tempZone
info:
comment:
2017-06-07 09:21:46 INFO UserAOHelper:129 - user built:User:
id:10022 name:bdvanschaik
userType:rodsuser
userDn:
zone:tempZone
info:
comment:
2017-06-07 09:21:46 INFO UserAOHelper:129 - user built:User:
id:10010 name:ds-immuno
userType:rodsadmin
userDn:
zone:tempZone
info:
comment:
2017-06-07 09:21:46 INFO UserAOHelper:129 - user built:User:
id:10007 name:ds-repmed
userType:rodsadmin
userDn:
zone:tempZone
info:
comment:
2017-06-07 09:21:46 INFO UserAOHelper:129 - user built:User:
id:35404 name:felipe
userType:rodsuser
userDn:
zone:tempZone
info:
comment:
2017-06-07 09:21:46 INFO UserAOHelper:129 - user built:User:
id:10025 name:foliveiragutierrez
userType:rodsuser
userDn:
zone:tempZone
info:
comment:
2017-06-07 09:21:46 INFO UserAOHelper:129 - user built:User:
id:10037 name:gp-immuno
userType:rodsgroup
userDn:
zone:tempZone
info:
comment:
2017-06-07 09:21:46 INFO UserAOHelper:129 - user built:User:
id:10034 name:gp-repmed
userType:rodsgroup
userDn:
zone:tempZone
info:
comment:
2017-06-07 09:21:46 INFO UserAOHelper:129 - user built:User:
id:15782 name:gp-test
userType:rodsgroup
userDn:
zone:tempZone
info:
comment:
2017-06-07 09:21:46 INFO UserAOHelper:129 - user built:User:
id:10028 name:pfdegeest
userType:rodsuser
userDn:
zone:tempZone
info:
comment:
2017-06-07 09:21:46 INFO UserAOHelper:129 - user built:User:
id:10004 name:pi-immuno
userType:rodsadmin
userDn:
zone:tempZone
info:
comment:
2017-06-07 09:21:46 INFO UserAOHelper:129 - user built:User:
id:10001 name:pi-repmed
userType:rodsadmin
userDn:
zone:tempZone
info:
comment:
2017-06-07 09:21:46 INFO UserAOHelper:129 - user built:User:
id:9002 name:public
userType:rodsgroup
userDn:
zone:tempZone
info:
comment:
2017-06-07 09:21:46 INFO UserAOHelper:129 - user built:User:
id:9010 name:rods
userType:rodsadmin
userDn:
zone:tempZone
info:
comment:
2017-06-07 09:21:46 INFO UserAOHelper:129 - user built:User:
id:9001 name:rodsadmin
userType:rodsgroup
userDn:
zone:tempZone
info:
comment:
2017-06-07 09:21:46 INFO UserAOHelper:129 - user built:User:
id:10031 name:sdolabarriaga
userType:rodsuser
userDn:
zone:tempZone
info:
comment:
2017-06-07 09:21:46 INFO UserAOHelper:129 - user built:User:
id:10016 name:ugp-immuno
userType:rodsuser
userDn:
zone:tempZone
info:
comment:
2017-06-07 09:21:46 INFO UserAOHelper:129 - user built:User:
id:10013 name:ugp-repmed
userType:rodsuser
userDn:
zone:tempZone
info:
comment:
2017-06-07 09:21:46 INFO UserAOHelper:129 - user built:User:
id:15785 name:ugp-test
userType:rodsuser
userDn:
zone:tempZone
info:
comment:
2017-06-07 09:21:46 DEBUG HibernateTransactionManager:367 - Creating new transaction with name [com.emc.metalnx.core.domain.dao.impl.UserDaoImpl.findAll]: PROPAGATION_REQUIRED,ISOLATION_DEFAULT; ''
2017-06-07 09:21:46 DEBUG SessionImpl:312 - Opened session at timestamp: 14968417063
2017-06-07 09:21:46 DEBUG HibernateTransactionManager:420 - Opened new Session [SessionImpl(PersistenceContext[entityKeys=[],collectionKeys=[]];ActionQueue[insertions=[] updates=[] deletions=[] collectionCreations=[] collectionRemovals=[] collectionUpdates=[] unresolvedInsertDependencies=UnresolvedEntityInsertActions[]])] for Hibernate transaction
2017-06-07 09:21:46 DEBUG HibernateTransactionManager:430 - Preparing JDBC Connection of Hibernate Session [SessionImpl(PersistenceContext[entityKeys=[],collectionKeys=[]];ActionQueue[insertions=[] updates=[] deletions=[] collectionCreations=[] collectionRemovals=[] collectionUpdates=[] unresolvedInsertDependencies=UnresolvedEntityInsertActions[]])]
2017-06-07 09:21:46 DEBUG AbstractTransactionImpl:158 - begin
2017-06-07 09:21:46 DEBUG LogicalConnectionImpl:295 - Obtaining JDBC connection
2017-06-07 09:21:46 DEBUG DriverManagerDataSource:142 - Creating new JDBC DriverManager Connection to [jdbc:mysql://127.0.0.1:3306/metalnx]
2017-06-07 09:21:46 DEBUG LogicalConnectionImpl:301 - Obtained JDBC connection
2017-06-07 09:21:46 DEBUG JdbcTransaction:69 - initial autocommit status: true
2017-06-07 09:21:46 DEBUG JdbcTransaction:71 - disabling autocommit
2017-06-07 09:21:46 DEBUG HibernateTransactionManager:491 - Exposing Hibernate transaction as JDBC transaction [org.hibernate.engine.jdbc.internal.proxy.ConnectionProxyHandler@163c6442[valid=true]]
2017-06-07 09:21:46 DEBUG SQL:104 - select datagridus0_.id as id5_, datagridus0_.additional_info as additional2_5_, datagridus0_.user_company as user3_5_, datagridus0_.data_grid_id as data4_5_, datagridus0_.user_department as user5_5_, datagridus0_.email as email5_, datagridus0_.enabled as enabled5_, datagridus0_.first_name as first8_5_, datagridus0_.forceFileOverwriting as forceFil9_5_, datagridus0_.last_name as last10_5_, datagridus0_.locale as locale5_, datagridus0_.organizational_role as organiz12_5_, datagridus0_.password as password5_, datagridus0_.user_title as user14_5_, datagridus0_.userProfile_id as userPro17_5_, datagridus0_.user_type as user15_5_, datagridus0_.username as username5_ from users datagridus0_
Hibernate: select datagridus0_.id as id5_, datagridus0_.additional_info as additional2_5_, datagridus0_.user_company as user3_5_, datagridus0_.data_grid_id as data4_5_, datagridus0_.user_department as user5_5_, datagridus0_.email as email5_, datagridus0_.enabled as enabled5_, datagridus0_.first_name as first8_5_, datagridus0_.forceFileOverwriting as forceFil9_5_, datagridus0_.last_name as last10_5_, datagridus0_.locale as locale5_, datagridus0_.organizational_role as organiz12_5_, datagridus0_.password as password5_, datagridus0_.user_title as user14_5_, datagridus0_.userProfile_id as userPro17_5_, datagridus0_.user_type as user15_5_, datagridus0_.username as username5_ from users datagridus0_
2017-06-07 09:21:46 DEBUG Loader:853 - Result set row: 0
2017-06-07 09:21:46 DEBUG Loader:1348 - Result row: EntityKey[com.emc.metalnx.core.domain.entity.DataGridUser#1]
2017-06-07 09:21:46 DEBUG Loader:853 - Result set row: 1
2017-06-07 09:21:46 DEBUG Loader:1348 - Result row: EntityKey[com.emc.metalnx.core.domain.entity.DataGridUser#2]
2017-06-07 09:21:46 DEBUG Loader:853 - Result set row: 2
2017-06-07 09:21:46 DEBUG Loader:1348 - Result row: EntityKey[com.emc.metalnx.core.domain.entity.DataGridUser#3]
2017-06-07 09:21:46 DEBUG Loader:853 - Result set row: 3
2017-06-07 09:21:46 DEBUG Loader:1348 - Result row: EntityKey[com.emc.metalnx.core.domain.entity.DataGridUser#4]
2017-06-07 09:21:46 DEBUG Loader:853 - Result set row: 4
2017-06-07 09:21:46 DEBUG Loader:1348 - Result row: EntityKey[com.emc.metalnx.core.domain.entity.DataGridUser#6]
2017-06-07 09:21:46 DEBUG Loader:853 - Result set row: 5
2017-06-07 09:21:46 DEBUG Loader:1348 - Result row: EntityKey[com.emc.metalnx.core.domain.entity.DataGridUser#7]
2017-06-07 09:21:46 DEBUG Loader:853 - Result set row: 6
2017-06-07 09:21:46 DEBUG Loader:1348 - Result row: EntityKey[com.emc.metalnx.core.domain.entity.DataGridUser#8]
2017-06-07 09:21:46 DEBUG Loader:853 - Result set row: 7
2017-06-07 09:21:46 DEBUG Loader:1348 - Result row: EntityKey[com.emc.metalnx.core.domain.entity.DataGridUser#9]
2017-06-07 09:21:46 DEBUG Loader:853 - Result set row: 8
2017-06-07 09:21:46 DEBUG Loader:1348 - Result row: EntityKey[com.emc.metalnx.core.domain.entity.DataGridUser#10]
2017-06-07 09:21:46 DEBUG Loader:853 - Result set row: 9
2017-06-07 09:21:46 DEBUG Loader:1348 - Result row: EntityKey[com.emc.metalnx.core.domain.entity.DataGridUser#11]
2017-06-07 09:21:46 DEBUG Loader:853 - Result set row: 10
2017-06-07 09:21:46 DEBUG Loader:1348 - Result row: EntityKey[com.emc.metalnx.core.domain.entity.DataGridUser#12]
2017-06-07 09:21:46 DEBUG Loader:853 - Result set row: 11
2017-06-07 09:21:46 DEBUG Loader:1348 - Result row: EntityKey[com.emc.metalnx.core.domain.entity.DataGridUser#13]
2017-06-07 09:21:46 DEBUG Loader:853 - Result set row: 12
2017-06-07 09:21:46 DEBUG Loader:1348 - Result row: EntityKey[com.emc.metalnx.core.domain.entity.DataGridUser#52]
2017-06-07 09:21:46 DEBUG Loader:853 - Result set row: 13
2017-06-07 09:21:46 DEBUG Loader:1348 - Result row: EntityKey[com.emc.metalnx.core.domain.entity.DataGridUser#53]
2017-06-07 09:21:46 DEBUG TwoPhaseLoad:158 - Resolving associations for [com.emc.metalnx.core.domain.entity.DataGridUser#1]
2017-06-07 09:21:46 DEBUG TwoPhaseLoad:297 - Done materializing entity [com.emc.metalnx.core.domain.entity.DataGridUser#1]
2017-06-07 09:21:46 DEBUG TwoPhaseLoad:158 - Resolving associations for [com.emc.metalnx.core.domain.entity.DataGridUser#2]
2017-06-07 09:21:46 DEBUG TwoPhaseLoad:297 - Done materializing entity [com.emc.metalnx.core.domain.entity.DataGridUser#2]
2017-06-07 09:21:46 DEBUG TwoPhaseLoad:158 - Resolving associations for [com.emc.metalnx.core.domain.entity.DataGridUser#3]
2017-06-07 09:21:46 DEBUG TwoPhaseLoad:297 - Done materializing entity [com.emc.metalnx.core.domain.entity.DataGridUser#3]
2017-06-07 09:21:46 DEBUG TwoPhaseLoad:158 - Resolving associations for [com.emc.metalnx.core.domain.entity.DataGridUser#4]
2017-06-07 09:21:46 DEBUG TwoPhaseLoad:297 - Done materializing entity [com.emc.metalnx.core.domain.entity.DataGridUser#4]
2017-06-07 09:21:46 DEBUG TwoPhaseLoad:158 - Resolving associations for [com.emc.metalnx.core.domain.entity.DataGridUser#6]
2017-06-07 09:21:46 DEBUG TwoPhaseLoad:297 - Done materializing entity [com.emc.metalnx.core.domain.entity.DataGridUser#6]
2017-06-07 09:21:46 DEBUG TwoPhaseLoad:158 - Resolving associations for [com.emc.metalnx.core.domain.entity.DataGridUser#7]
2017-06-07 09:21:46 DEBUG TwoPhaseLoad:297 - Done materializing entity [com.emc.metalnx.core.domain.entity.DataGridUser#7]
2017-06-07 09:21:46 DEBUG TwoPhaseLoad:158 - Resolving associations for [com.emc.metalnx.core.domain.entity.DataGridUser#8]
2017-06-07 09:21:46 DEBUG TwoPhaseLoad:297 - Done materializing entity [com.emc.metalnx.core.domain.entity.DataGridUser#8]
2017-06-07 09:21:46 DEBUG TwoPhaseLoad:158 - Resolving associations for [com.emc.metalnx.core.domain.entity.DataGridUser#9]
2017-06-07 09:21:46 DEBUG TwoPhaseLoad:297 - Done materializing entity [com.emc.metalnx.core.domain.entity.DataGridUser#9]
2017-06-07 09:21:46 DEBUG TwoPhaseLoad:158 - Resolving associations for [com.emc.metalnx.core.domain.entity.DataGridUser#10]
2017-06-07 09:21:46 DEBUG TwoPhaseLoad:297 - Done materializing entity [com.emc.metalnx.core.domain.entity.DataGridUser#10]
2017-06-07 09:21:46 DEBUG TwoPhaseLoad:158 - Resolving associations for [com.emc.metalnx.core.domain.entity.DataGridUser#11]
2017-06-07 09:21:46 DEBUG TwoPhaseLoad:297 - Done materializing entity [com.emc.metalnx.core.domain.entity.DataGridUser#11]
2017-06-07 09:21:46 DEBUG TwoPhaseLoad:158 - Resolving associations for [com.emc.metalnx.core.domain.entity.DataGridUser#12]
2017-06-07 09:21:46 DEBUG TwoPhaseLoad:297 - Done materializing entity [com.emc.metalnx.core.domain.entity.DataGridUser#12]
2017-06-07 09:21:46 DEBUG TwoPhaseLoad:158 - Resolving associations for [com.emc.metalnx.core.domain.entity.DataGridUser#13]
2017-06-07 09:21:46 DEBUG TwoPhaseLoad:297 - Done materializing entity [com.emc.metalnx.core.domain.entity.DataGridUser#13]
2017-06-07 09:21:46 DEBUG TwoPhaseLoad:158 - Resolving associations for [com.emc.metalnx.core.domain.entity.DataGridUser#52]
2017-06-07 09:21:46 DEBUG TwoPhaseLoad:297 - Done materializing entity [com.emc.metalnx.core.domain.entity.DataGridUser#52]
2017-06-07 09:21:46 DEBUG TwoPhaseLoad:158 - Resolving associations for [com.emc.metalnx.core.domain.entity.DataGridUser#53]
2017-06-07 09:21:46 DEBUG TwoPhaseLoad:297 - Done materializing entity [com.emc.metalnx.core.domain.entity.DataGridUser#53]
2017-06-07 09:21:46 DEBUG StatefulPersistenceContext:1007 - Initializing non-lazy collections
2017-06-07 09:21:46 DEBUG Loader:2089 - Loading collection: [com.emc.metalnx.core.domain.entity.DataGridUser.favorites#53]
2017-06-07 09:21:46 DEBUG SQL:104 - select favorites0_.user_id as user7_5_1_, favorites0_.id as id7_1_, favorites0_.id as id7_0_, favorites0_.created_at as created2_7_0_, favorites0_.is_collection as is3_7_0_, favorites0_.name as name7_0_, favorites0_.path as path7_0_, favorites0_.path_hash as path6_7_0_, favorites0_.user_id as user7_7_0_ from user_favorites favorites0_ where favorites0_.user_id=?
Hibernate: select favorites0_.user_id as user7_5_1_, favorites0_.id as id7_1_, favorites0_.id as id7_0_, favorites0_.created_at as created2_7_0_, favorites0_.is_collection as is3_7_0_, favorites0_.name as name7_0_, favorites0_.path as path7_0_, favorites0_.path_hash as path6_7_0_, favorites0_.user_id as user7_7_0_ from user_favorites favorites0_ where favorites0_.user_id=?
2017-06-07 09:21:46 DEBUG Loader:1234 - Result set contains (possibly empty) collection: [com.emc.metalnx.core.domain.entity.DataGridUser.favorites#53]
2017-06-07 09:21:46 DEBUG CollectionLoadContext:229 - 1 collections were found in result set for role: com.emc.metalnx.core.domain.entity.DataGridUser.favorites
2017-06-07 09:21:46 DEBUG CollectionLoadContext:266 - Collection fully initialized: [com.emc.metalnx.core.domain.entity.DataGridUser.favorites#53]
2017-06-07 09:21:46 DEBUG CollectionLoadContext:236 - 1 collections initialized for role: com.emc.metalnx.core.domain.entity.DataGridUser.favorites
2017-06-07 09:21:46 DEBUG Loader:2109 - Done loading collection
2017-06-07 09:21:46 DEBUG Loader:2089 - Loading collection: [com.emc.metalnx.core.domain.entity.DataGridUser.bookmarks#53]
2017-06-07 09:21:46 DEBUG SQL:104 - select bookmarks0_.user_id as user7_5_1_, bookmarks0_.id as id6_1_, bookmarks0_.id as id6_0_, bookmarks0_.created_at as created2_6_0_, bookmarks0_.is_collection as is3_6_0_, bookmarks0_.is_notified as is4_6_0_, bookmarks0_.name as name6_0_, bookmarks0_.path as path6_0_, bookmarks0_.user_id as user7_6_0_ from user_bookmarks bookmarks0_ where bookmarks0_.user_id=?
Hibernate: select bookmarks0_.user_id as user7_5_1_, bookmarks0_.id as id6_1_, bookmarks0_.id as id6_0_, bookmarks0_.created_at as created2_6_0_, bookmarks0_.is_collection as is3_6_0_, bookmarks0_.is_notified as is4_6_0_, bookmarks0_.name as name6_0_, bookmarks0_.path as path6_0_, bookmarks0_.user_id as user7_6_0_ from user_bookmarks bookmarks0_ where bookmarks0_.user_id=?
2017-06-07 09:21:46 DEBUG Loader:1234 - Result set contains (possibly empty) collection: [com.emc.metalnx.core.domain.entity.DataGridUser.bookmarks#53]
2017-06-07 09:21:46 DEBUG CollectionLoadContext:229 - 1 collections were found in result set for role: com.emc.metalnx.core.domain.entity.DataGridUser.bookmarks
2017-06-07 09:21:46 DEBUG CollectionLoadContext:266 - Collection fully initialized: [com.emc.metalnx.core.domain.entity.DataGridUser.bookmarks#53]
2017-06-07 09:21:46 DEBUG CollectionLoadContext:236 - 1 collections initialized for role: com.emc.metalnx.core.domain.entity.DataGridUser.bookmarks
2017-06-07 09:21:46 DEBUG Loader:2109 - Done loading collection
2017-06-07 09:21:46 DEBUG Loader:2089 - Loading collection: [com.emc.metalnx.core.domain.entity.DataGridUser.favorites#52]
2017-06-07 09:21:46 DEBUG SQL:104 - select favorites0_.user_id as user7_5_1_, favorites0_.id as id7_1_, favorites0_.id as id7_0_, favorites0_.created_at as created2_7_0_, favorites0_.is_collection as is3_7_0_, favorites0_.name as name7_0_, favorites0_.path as path7_0_, favorites0_.path_hash as path6_7_0_, favorites0_.user_id as user7_7_0_ from user_favorites favorites0_ where favorites0_.user_id=?
Hibernate: select favorites0_.user_id as user7_5_1_, favorites0_.id as id7_1_, favorites0_.id as id7_0_, favorites0_.created_at as created2_7_0_, favorites0_.is_collection as is3_7_0_, favorites0_.name as name7_0_, favorites0_.path as path7_0_, favorites0_.path_hash as path6_7_0_, favorites0_.user_id as user7_7_0_ from user_favorites favorites0_ where favorites0_.user_id=?
2017-06-07 09:21:46 DEBUG Loader:1234 - Result set contains (possibly empty) collection: [com.emc.metalnx.core.domain.entity.DataGridUser.favorites#52]
2017-06-07 09:21:46 DEBUG CollectionLoadContext:229 - 1 collections were found in result set for role: com.emc.metalnx.core.domain.entity.DataGridUser.favorites
2017-06-07 09:21:46 DEBUG CollectionLoadContext:266 - Collection fully initialized: [com.emc.metalnx.core.domain.entity.DataGridUser.favorites#52]
2017-06-07 09:21:46 DEBUG CollectionLoadContext:236 - 1 collections initialized for role: com.emc.metalnx.core.domain.entity.DataGridUser.favorites
2017-06-07 09:21:46 DEBUG Loader:2109 - Done loading collection
2017-06-07 09:21:46 DEBUG Loader:2089 - Loading collection: [com.emc.metalnx.core.domain.entity.DataGridUser.bookmarks#52]
2017-06-07 09:21:46 DEBUG SQL:104 - select bookmarks0_.user_id as user7_5_1_, bookmarks0_.id as id6_1_, bookmarks0_.id as id6_0_, bookmarks0_.created_at as created2_6_0_, bookmarks0_.is_collection as is3_6_0_, bookmarks0_.is_notified as is4_6_0_, bookmarks0_.name as name6_0_, bookmarks0_.path as path6_0_, bookmarks0_.user_id as user7_6_0_ from user_bookmarks bookmarks0_ where bookmarks0_.user_id=?
Hibernate: select bookmarks0_.user_id as user7_5_1_, bookmarks0_.id as id6_1_, bookmarks0_.id as id6_0_, bookmarks0_.created_at as created2_6_0_, bookmarks0_.is_collection as is3_6_0_, bookmarks0_.is_notified as is4_6_0_, bookmarks0_.name as name6_0_, bookmarks0_.path as path6_0_, bookmarks0_.user_id as user7_6_0_ from user_bookmarks bookmarks0_ where bookmarks0_.user_id=?
2017-06-07 09:21:46 DEBUG Loader:1234 - Result set contains (possibly empty) collection: [com.emc.metalnx.core.domain.entity.DataGridUser.bookmarks#52]
2017-06-07 09:21:46 DEBUG CollectionLoadContext:229 - 1 collections were found in result set for role: com.emc.metalnx.core.domain.entity.DataGridUser.bookmarks
2017-06-07 09:21:46 DEBUG CollectionLoadContext:266 - Collection fully initialized: [com.emc.metalnx.core.domain.entity.DataGridUser.bookmarks#52]
2017-06-07 09:21:46 DEBUG CollectionLoadContext:236 - 1 collections initialized for role: com.emc.metalnx.core.domain.entity.DataGridUser.bookmarks
2017-06-07 09:21:46 DEBUG Loader:2109 - Done loading collection
2017-06-07 09:21:46 DEBUG Loader:2089 - Loading collection: [com.emc.metalnx.core.domain.entity.DataGridUser.favorites#13]
2017-06-07 09:21:46 DEBUG SQL:104 - select favorites0_.user_id as user7_5_1_, favorites0_.id as id7_1_, favorites0_.id as id7_0_, favorites0_.created_at as created2_7_0_, favorites0_.is_collection as is3_7_0_, favorites0_.name as name7_0_, favorites0_.path as path7_0_, favorites0_.path_hash as path6_7_0_, favorites0_.user_id as user7_7_0_ from user_favorites favorites0_ where favorites0_.user_id=?
Hibernate: select favorites0_.user_id as user7_5_1_, favorites0_.id as id7_1_, favorites0_.id as id7_0_, favorites0_.created_at as created2_7_0_, favorites0_.is_collection as is3_7_0_, favorites0_.name as name7_0_, favorites0_.path as path7_0_, favorites0_.path_hash as path6_7_0_, favorites0_.user_id as user7_7_0_ from user_favorites favorites0_ where favorites0_.user_id=?
2017-06-07 09:21:46 DEBUG Loader:1234 - Result set contains (possibly empty) collection: [com.emc.metalnx.core.domain.entity.DataGridUser.favorites#13]
2017-06-07 09:21:46 DEBUG CollectionLoadContext:229 - 1 collections were found in result set for role: com.emc.metalnx.core.domain.entity.DataGridUser.favorites
2017-06-07 09:21:46 DEBUG CollectionLoadContext:266 - Collection fully initialized: [com.emc.metalnx.core.domain.entity.DataGridUser.favorites#13]
2017-06-07 09:21:46 DEBUG CollectionLoadContext:236 - 1 collections initialized for role: com.emc.metalnx.core.domain.entity.DataGridUser.favorites
2017-06-07 09:21:46 DEBUG Loader:2109 - Done loading collection
2017-06-07 09:21:46 DEBUG Loader:2089 - Loading collection: [com.emc.metalnx.core.domain.entity.DataGridUser.bookmarks#13]
2017-06-07 09:21:46 DEBUG SQL:104 - select bookmarks0_.user_id as user7_5_1_, bookmarks0_.id as id6_1_, bookmarks0_.id as id6_0_, bookmarks0_.created_at as created2_6_0_, bookmarks0_.is_collection as is3_6_0_, bookmarks0_.is_notified as is4_6_0_, bookmarks0_.name as name6_0_, bookmarks0_.path as path6_0_, bookmarks0_.user_id as user7_6_0_ from user_bookmarks bookmarks0_ where bookmarks0_.user_id=?
Hibernate: select bookmarks0_.user_id as user7_5_1_, bookmarks0_.id as id6_1_, bookmarks0_.id as id6_0_, bookmarks0_.created_at as created2_6_0_, bookmarks0_.is_collection as is3_6_0_, bookmarks0_.is_notified as is4_6_0_, bookmarks0_.name as name6_0_, bookmarks0_.path as path6_0_, bookmarks0_.user_id as user7_6_0_ from user_bookmarks bookmarks0_ where bookmarks0_.user_id=?
2017-06-07 09:21:46 DEBUG Loader:1234 - Result set contains (possibly empty) collection: [com.emc.metalnx.core.domain.entity.DataGridUser.bookmarks#13]
2017-06-07 09:21:46 DEBUG CollectionLoadContext:229 - 1 collections were found in result set for role: com.emc.metalnx.core.domain.entity.DataGridUser.bookmarks
2017-06-07 09:21:46 DEBUG CollectionLoadContext:266 - Collection fully initialized: [com.emc.metalnx.core.domain.entity.DataGridUser.bookmarks#13]
2017-06-07 09:21:46 DEBUG CollectionLoadContext:236 - 1 collections initialized for role: com.emc.metalnx.core.domain.entity.DataGridUser.bookmarks
2017-06-07 09:21:46 DEBUG Loader:2109 - Done loading collection
2017-06-07 09:21:46 DEBUG Loader:2089 - Loading collection: [com.emc.metalnx.core.domain.entity.DataGridUser.favorites#12]
2017-06-07 09:21:46 DEBUG SQL:104 - select favorites0_.user_id as user7_5_1_, favorites0_.id as id7_1_, favorites0_.id as id7_0_, favorites0_.created_at as created2_7_0_, favorites0_.is_collection as is3_7_0_, favorites0_.name as name7_0_, favorites0_.path as path7_0_, favorites0_.path_hash as path6_7_0_, favorites0_.user_id as user7_7_0_ from user_favorites favorites0_ where favorites0_.user_id=?
Hibernate: select favorites0_.user_id as user7_5_1_, favorites0_.id as id7_1_, favorites0_.id as id7_0_, favorites0_.created_at as created2_7_0_, favorites0_.is_collection as is3_7_0_, favorites0_.name as name7_0_, favorites0_.path as path7_0_, favorites0_.path_hash as path6_7_0_, favorites0_.user_id as user7_7_0_ from user_favorites favorites0_ where favorites0_.user_id=?
2017-06-07 09:21:46 DEBUG Loader:1234 - Result set contains (possibly empty) collection: [com.emc.metalnx.core.domain.entity.DataGridUser.favorites#12]
2017-06-07 09:21:46 DEBUG CollectionLoadContext:229 - 1 collections were found in result set for role: com.emc.metalnx.core.domain.entity.DataGridUser.favorites
2017-06-07 09:21:46 DEBUG CollectionLoadContext:266 - Collection fully initialized: [com.emc.metalnx.core.domain.entity.DataGridUser.favorites#12]
2017-06-07 09:21:46 DEBUG CollectionLoadContext:236 - 1 collections initialized for role: com.emc.metalnx.core.domain.entity.DataGridUser.favorites
2017-06-07 09:21:46 DEBUG Loader:2109 - Done loading collection
2017-06-07 09:21:46 DEBUG Loader:2089 - Loading collection: [com.emc.metalnx.core.domain.entity.DataGridUser.bookmarks#12]
2017-06-07 09:21:46 DEBUG SQL:104 - select bookmarks0_.user_id as user7_5_1_, bookmarks0_.id as id6_1_, bookmarks0_.id as id6_0_, bookmarks0_.created_at as created2_6_0_, bookmarks0_.is_collection as is3_6_0_, bookmarks0_.is_notified as is4_6_0_, bookmarks0_.name as name6_0_, bookmarks0_.path as path6_0_, bookmarks0_.user_id as user7_6_0_ from user_bookmarks bookmarks0_ where bookmarks0_.user_id=?
Hibernate: select bookmarks0_.user_id as user7_5_1_, bookmarks0_.id as id6_1_, bookmarks0_.id as id6_0_, bookmarks0_.created_at as created2_6_0_, bookmarks0_.is_collection as is3_6_0_, bookmarks0_.is_notified as is4_6_0_, bookmarks0_.name as name6_0_, bookmarks0_.path as path6_0_, bookmarks0_.user_id as user7_6_0_ from user_bookmarks bookmarks0_ where bookmarks0_.user_id=?
2017-06-07 09:21:46 DEBUG Loader:1234 - Result set contains (possibly empty) collection: [com.emc.metalnx.core.domain.entity.DataGridUser.bookmarks#12]
2017-06-07 09:21:46 DEBUG CollectionLoadContext:229 - 1 collections were found in result set for role: com.emc.metalnx.core.domain.entity.DataGridUser.bookmarks
2017-06-07 09:21:46 DEBUG CollectionLoadContext:266 - Collection fully initialized: [com.emc.metalnx.core.domain.entity.DataGridUser.bookmarks#12]
2017-06-07 09:21:46 DEBUG CollectionLoadContext:236 - 1 collections initialized for role: com.emc.metalnx.core.domain.entity.DataGridUser.bookmarks
2017-06-07 09:21:46 DEBUG Loader:2109 - Done loading collection
2017-06-07 09:21:46 DEBUG Loader:2089 - Loading collection: [com.emc.metalnx.core.domain.entity.DataGridUser.favorites#11]
2017-06-07 09:21:46 DEBUG SQL:104 - select favorites0_.user_id as user7_5_1_, favorites0_.id as id7_1_, favorites0_.id as id7_0_, favorites0_.created_at as created2_7_0_, favorites0_.is_collection as is3_7_0_, favorites0_.name as name7_0_, favorites0_.path as path7_0_, favorites0_.path_hash as path6_7_0_, favorites0_.user_id as user7_7_0_ from user_favorites favorites0_ where favorites0_.user_id=?
Hibernate: select favorites0_.user_id as user7_5_1_, favorites0_.id as id7_1_, favorites0_.id as id7_0_, favorites0_.created_at as created2_7_0_, favorites0_.is_collection as is3_7_0_, favorites0_.name as name7_0_, favorites0_.path as path7_0_, favorites0_.path_hash as path6_7_0_, favorites0_.user_id as user7_7_0_ from user_favorites favorites0_ where favorites0_.user_id=?
2017-06-07 09:21:46 DEBUG Loader:1234 - Result set contains (possibly empty) collection: [com.emc.metalnx.core.domain.entity.DataGridUser.favorites#11]
2017-06-07 09:21:46 DEBUG CollectionLoadContext:229 - 1 collections were found in result set for role: com.emc.metalnx.core.domain.entity.DataGridUser.favorites
2017-06-07 09:21:46 DEBUG CollectionLoadContext:266 - Collection fully initialized: [com.emc.metalnx.core.domain.entity.DataGridUser.favorites#11]
2017-06-07 09:21:46 DEBUG CollectionLoadContext:236 - 1 collections initialized for role: com.emc.metalnx.core.domain.entity.DataGridUser.favorites
2017-06-07 09:21:46 DEBUG Loader:2109 - Done loading collection
2017-06-07 09:21:46 DEBUG Loader:2089 - Loading collection: [com.emc.metalnx.core.domain.entity.DataGridUser.bookmarks#11]
2017-06-07 09:21:46 DEBUG SQL:104 - select bookmarks0_.user_id as user7_5_1_, bookmarks0_.id as id6_1_, bookmarks0_.id as id6_0_, bookmarks0_.created_at as created2_6_0_, bookmarks0_.is_collection as is3_6_0_, bookmarks0_.is_notified as is4_6_0_, bookmarks0_.name as name6_0_, bookmarks0_.path as path6_0_, bookmarks0_.user_id as user7_6_0_ from user_bookmarks bookmarks0_ where bookmarks0_.user_id=?
Hibernate: select bookmarks0_.user_id as user7_5_1_, bookmarks0_.id as id6_1_, bookmarks0_.id as id6_0_, bookmarks0_.created_at as created2_6_0_, bookmarks0_.is_collection as is3_6_0_, bookmarks0_.is_notified as is4_6_0_, bookmarks0_.name as name6_0_, bookmarks0_.path as path6_0_, bookmarks0_.user_id as user7_6_0_ from user_bookmarks bookmarks0_ where bookmarks0_.user_id=?
2017-06-07 09:21:46 DEBUG Loader:1234 - Result set contains (possibly empty) collection: [com.emc.metalnx.core.domain.entity.DataGridUser.bookmarks#11]
2017-06-07 09:21:46 DEBUG CollectionLoadContext:229 - 1 collections were found in result set for role: com.emc.metalnx.core.domain.entity.DataGridUser.bookmarks
2017-06-07 09:21:46 DEBUG CollectionLoadContext:266 - Collection fully initialized: [com.emc.metalnx.core.domain.entity.DataGridUser.bookmarks#11]
2017-06-07 09:21:46 DEBUG CollectionLoadContext:236 - 1 collections initialized for role: com.emc.metalnx.core.domain.entity.DataGridUser.bookmarks
2017-06-07 09:21:46 DEBUG Loader:2109 - Done loading collection
2017-06-07 09:21:46 DEBUG Loader:2089 - Loading collection: [com.emc.metalnx.core.domain.entity.DataGridUser.favorites#10]
2017-06-07 09:21:46 DEBUG SQL:104 - select favorites0_.user_id as user7_5_1_, favorites0_.id as id7_1_, favorites0_.id as id7_0_, favorites0_.created_at as created2_7_0_, favorites0_.is_collection as is3_7_0_, favorites0_.name as name7_0_, favorites0_.path as path7_0_, favorites0_.path_hash as path6_7_0_, favorites0_.user_id as user7_7_0_ from user_favorites favorites0_ where favorites0_.user_id=?
Hibernate: select favorites0_.user_id as user7_5_1_, favorites0_.id as id7_1_, favorites0_.id as id7_0_, favorites0_.created_at as created2_7_0_, favorites0_.is_collection as is3_7_0_, favorites0_.name as name7_0_, favorites0_.path as path7_0_, favorites0_.path_hash as path6_7_0_, favorites0_.user_id as user7_7_0_ from user_favorites favorites0_ where favorites0_.user_id=?
2017-06-07 09:21:46 DEBUG Loader:1234 - Result set contains (possibly empty) collection: [com.emc.metalnx.core.domain.entity.DataGridUser.favorites#10]
2017-06-07 09:21:46 DEBUG CollectionLoadContext:229 - 1 collections were found in result set for role: com.emc.metalnx.core.domain.entity.DataGridUser.favorites
2017-06-07 09:21:46 DEBUG CollectionLoadContext:266 - Collection fully initialized: [com.emc.metalnx.core.domain.entity.DataGridUser.favorites#10]
2017-06-07 09:21:46 DEBUG CollectionLoadContext:236 - 1 collections initialized for role: com.emc.metalnx.core.domain.entity.DataGridUser.favorites
2017-06-07 09:21:46 DEBUG Loader:2109 - Done loading collection
2017-06-07 09:21:46 DEBUG Loader:2089 - Loading collection: [com.emc.metalnx.core.domain.entity.DataGridUser.bookmarks#10]
2017-06-07 09:21:46 DEBUG SQL:104 - select bookmarks0_.user_id as user7_5_1_, bookmarks0_.id as id6_1_, bookmarks0_.id as id6_0_, bookmarks0_.created_at as created2_6_0_, bookmarks0_.is_collection as is3_6_0_, bookmarks0_.is_notified as is4_6_0_, bookmarks0_.name as name6_0_, bookmarks0_.path as path6_0_, bookmarks0_.user_id as user7_6_0_ from user_bookmarks bookmarks0_ where bookmarks0_.user_id=?
Hibernate: select bookmarks0_.user_id as user7_5_1_, bookmarks0_.id as id6_1_, bookmarks0_.id as id6_0_, bookmarks0_.created_at as created2_6_0_, bookmarks0_.is_collection as is3_6_0_, bookmarks0_.is_notified as is4_6_0_, bookmarks0_.name as name6_0_, bookmarks0_.path as path6_0_, bookmarks0_.user_id as user7_6_0_ from user_bookmarks bookmarks0_ where bookmarks0_.user_id=?
2017-06-07 09:21:46 DEBUG Loader:1234 - Result set contains (possibly empty) collection: [com.emc.metalnx.core.domain.entity.DataGridUser.bookmarks#10]
2017-06-07 09:21:46 DEBUG CollectionLoadContext:229 - 1 collections were found in result set for role: com.emc.metalnx.core.domain.entity.DataGridUser.bookmarks
2017-06-07 09:21:46 DEBUG CollectionLoadContext:266 - Collection fully initialized: [com.emc.metalnx.core.domain.entity.DataGridUser.bookmarks#10]
2017-06-07 09:21:46 DEBUG CollectionLoadContext:236 - 1 collections initialized for role: com.emc.metalnx.core.domain.entity.DataGridUser.bookmarks
2017-06-07 09:21:46 DEBUG Loader:2109 - Done loading collection
2017-06-07 09:21:46 DEBUG Loader:2089 - Loading collection: [com.emc.metalnx.core.domain.entity.DataGridUser.favorites#9]
2017-06-07 09:21:46 DEBUG SQL:104 - select favorites0_.user_id as user7_5_1_, favorites0_.id as id7_1_, favorites0_.id as id7_0_, favorites0_.created_at as created2_7_0_, favorites0_.is_collection as is3_7_0_, favorites0_.name as name7_0_, favorites0_.path as path7_0_, favorites0_.path_hash as path6_7_0_, favorites0_.user_id as user7_7_0_ from user_favorites favorites0_ where favorites0_.user_id=?
Hibernate: select favorites0_.user_id as user7_5_1_, favorites0_.id as id7_1_, favorites0_.id as id7_0_, favorites0_.created_at as created2_7_0_, favorites0_.is_collection as is3_7_0_, favorites0_.name as name7_0_, favorites0_.path as path7_0_, favorites0_.path_hash as path6_7_0_, favorites0_.user_id as user7_7_0_ from user_favorites favorites0_ where favorites0_.user_id=?
2017-06-07 09:21:46 DEBUG Loader:1234 - Result set contains (possibly empty) collection: [com.emc.metalnx.core.domain.entity.DataGridUser.favorites#9]
2017-06-07 09:21:46 DEBUG CollectionLoadContext:229 - 1 collections were found in result set for role: com.emc.metalnx.core.domain.entity.DataGridUser.favorites
2017-06-07 09:21:46 DEBUG CollectionLoadContext:266 - Collection fully initialized: [com.emc.metalnx.core.domain.entity.DataGridUser.favorites#9]
2017-06-07 09:21:46 DEBUG CollectionLoadContext:236 - 1 collections initialized for role: com.emc.metalnx.core.domain.entity.DataGridUser.favorites
2017-06-07 09:21:46 DEBUG Loader:2109 - Done loading collection
2017-06-07 09:21:46 DEBUG Loader:2089 - Loading collection: [com.emc.metalnx.core.domain.entity.DataGridUser.bookmarks#9]
2017-06-07 09:21:46 DEBUG SQL:104 - select bookmarks0_.user_id as user7_5_1_, bookmarks0_.id as id6_1_, bookmarks0_.id as id6_0_, bookmarks0_.created_at as created2_6_0_, bookmarks0_.is_collection as is3_6_0_, bookmarks0_.is_notified as is4_6_0_, bookmarks0_.name as name6_0_, bookmarks0_.path as path6_0_, bookmarks0_.user_id as user7_6_0_ from user_bookmarks bookmarks0_ where bookmarks0_.user_id=?
Hibernate: select bookmarks0_.user_id as user7_5_1_, bookmarks0_.id as id6_1_, bookmarks0_.id as id6_0_, bookmarks0_.created_at as created2_6_0_, bookmarks0_.is_collection as is3_6_0_, bookmarks0_.is_notified as is4_6_0_, bookmarks0_.name as name6_0_, bookmarks0_.path as path6_0_, bookmarks0_.user_id as user7_6_0_ from user_bookmarks bookmarks0_ where bookmarks0_.user_id=?
2017-06-07 09:21:46 DEBUG Loader:1234 - Result set contains (possibly empty) collection: [com.emc.metalnx.core.domain.entity.DataGridUser.bookmarks#9]
2017-06-07 09:21:46 DEBUG CollectionLoadContext:229 - 1 collections were found in result set for role: com.emc.metalnx.core.domain.entity.DataGridUser.bookmarks
2017-06-07 09:21:46 DEBUG CollectionLoadContext:266 - Collection fully initialized: [com.emc.metalnx.core.domain.entity.DataGridUser.bookmarks#9]
2017-06-07 09:21:46 DEBUG CollectionLoadContext:236 - 1 collections initialized for role: com.emc.metalnx.core.domain.entity.DataGridUser.bookmarks
2017-06-07 09:21:46 DEBUG Loader:2109 - Done loading collection
2017-06-07 09:21:46 DEBUG Loader:2089 - Loading collection: [com.emc.metalnx.core.domain.entity.DataGridUser.favorites#8]
2017-06-07 09:21:46 DEBUG SQL:104 - select favorites0_.user_id as user7_5_1_, favorites0_.id as id7_1_, favorites0_.id as id7_0_, favorites0_.created_at as created2_7_0_, favorites0_.is_collection as is3_7_0_, favorites0_.name as name7_0_, favorites0_.path as path7_0_, favorites0_.path_hash as path6_7_0_, favorites0_.user_id as user7_7_0_ from user_favorites favorites0_ where favorites0_.user_id=?
Hibernate: select favorites0_.user_id as user7_5_1_, favorites0_.id as id7_1_, favorites0_.id as id7_0_, favorites0_.created_at as created2_7_0_, favorites0_.is_collection as is3_7_0_, favorites0_.name as name7_0_, favorites0_.path as path7_0_, favorites0_.path_hash as path6_7_0_, favorites0_.user_id as user7_7_0_ from user_favorites favorites0_ where favorites0_.user_id=?
2017-06-07 09:21:46 DEBUG Loader:1234 - Result set contains (possibly empty) collection: [com.emc.metalnx.core.domain.entity.DataGridUser.favorites#8]
2017-06-07 09:21:46 DEBUG CollectionLoadContext:229 - 1 collections were found in result set for role: com.emc.metalnx.core.domain.entity.DataGridUser.favorites
2017-06-07 09:21:46 DEBUG CollectionLoadContext:266 - Collection fully initialized: [com.emc.metalnx.core.domain.entity.DataGridUser.favorites#8]
2017-06-07 09:21:46 DEBUG CollectionLoadContext:236 - 1 collections initialized for role: com.emc.metalnx.core.domain.entity.DataGridUser.favorites
2017-06-07 09:21:46 DEBUG Loader:2109 - Done loading collection
2017-06-07 09:21:46 DEBUG Loader:2089 - Loading collection: [com.emc.metalnx.core.domain.entity.DataGridUser.bookmarks#8]
2017-06-07 09:21:46 DEBUG SQL:104 - select bookmarks0_.user_id as user7_5_1_, bookmarks0_.id as id6_1_, bookmarks0_.id as id6_0_, bookmarks0_.created_at as created2_6_0_, bookmarks0_.is_collection as is3_6_0_, bookmarks0_.is_notified as is4_6_0_, bookmarks0_.name as name6_0_, bookmarks0_.path as path6_0_, bookmarks0_.user_id as user7_6_0_ from user_bookmarks bookmarks0_ where bookmarks0_.user_id=?
Hibernate: select bookmarks0_.user_id as user7_5_1_, bookmarks0_.id as id6_1_, bookmarks0_.id as id6_0_, bookmarks0_.created_at as created2_6_0_, bookmarks0_.is_collection as is3_6_0_, bookmarks0_.is_notified as is4_6_0_, bookmarks0_.name as name6_0_, bookmarks0_.path as path6_0_, bookmarks0_.user_id as user7_6_0_ from user_bookmarks bookmarks0_ where bookmarks0_.user_id=?
2017-06-07 09:21:46 DEBUG Loader:1234 - Result set contains (possibly empty) collection: [com.emc.metalnx.core.domain.entity.DataGridUser.bookmarks#8]
2017-06-07 09:21:46 DEBUG CollectionLoadContext:229 - 1 collections were found in result set for role: com.emc.metalnx.core.domain.entity.DataGridUser.bookmarks
2017-06-07 09:21:46 DEBUG CollectionLoadContext:266 - Collection fully initialized: [com.emc.metalnx.core.domain.entity.DataGridUser.bookmarks#8]
2017-06-07 09:21:46 DEBUG CollectionLoadContext:236 - 1 collections initialized for role: com.emc.metalnx.core.domain.entity.DataGridUser.bookmarks
2017-06-07 09:21:46 DEBUG Loader:2109 - Done loading collection
2017-06-07 09:21:46 DEBUG Loader:2089 - Loading collection: [com.emc.metalnx.core.domain.entity.DataGridUser.favorites#7]
2017-06-07 09:21:46 DEBUG SQL:104 - select favorites0_.user_id as user7_5_1_, favorites0_.id as id7_1_, favorites0_.id as id7_0_, favorites0_.created_at as created2_7_0_, favorites0_.is_collection as is3_7_0_, favorites0_.name as name7_0_, favorites0_.path as path7_0_, favorites0_.path_hash as path6_7_0_, favorites0_.user_id as user7_7_0_ from user_favorites favorites0_ where favorites0_.user_id=?
Hibernate: select favorites0_.user_id as user7_5_1_, favorites0_.id as id7_1_, favorites0_.id as id7_0_, favorites0_.created_at as created2_7_0_, favorites0_.is_collection as is3_7_0_, favorites0_.name as name7_0_, favorites0_.path as path7_0_, favorites0_.path_hash as path6_7_0_, favorites0_.user_id as user7_7_0_ from user_favorites favorites0_ where favorites0_.user_id=?
2017-06-07 09:21:46 DEBUG Loader:1234 - Result set contains (possibly empty) collection: [com.emc.metalnx.core.domain.entity.DataGridUser.favorites#7]
2017-06-07 09:21:46 DEBUG CollectionLoadContext:229 - 1 collections were found in result set for role: com.emc.metalnx.core.domain.entity.DataGridUser.favorites
2017-06-07 09:21:46 DEBUG CollectionLoadContext:266 - Collection fully initialized: [com.emc.metalnx.core.domain.entity.DataGridUser.favorites#7]
2017-06-07 09:21:46 DEBUG CollectionLoadContext:236 - 1 collections initialized for role: com.emc.metalnx.core.domain.entity.DataGridUser.favorites
2017-06-07 09:21:46 DEBUG Loader:2109 - Done loading collection
2017-06-07 09:21:46 DEBUG Loader:2089 - Loading collection: [com.emc.metalnx.core.domain.entity.DataGridUser.bookmarks#7]
2017-06-07 09:21:46 DEBUG SQL:104 - select bookmarks0_.user_id as user7_5_1_, bookmarks0_.id as id6_1_, bookmarks0_.id as id6_0_, bookmarks0_.created_at as created2_6_0_, bookmarks0_.is_collection as is3_6_0_, bookmarks0_.is_notified as is4_6_0_, bookmarks0_.name as name6_0_, bookmarks0_.path as path6_0_, bookmarks0_.user_id as user7_6_0_ from user_bookmarks bookmarks0_ where bookmarks0_.user_id=?
Hibernate: select bookmarks0_.user_id as user7_5_1_, bookmarks0_.id as id6_1_, bookmarks0_.id as id6_0_, bookmarks0_.created_at as created2_6_0_, bookmarks0_.is_collection as is3_6_0_, bookmarks0_.is_notified as is4_6_0_, bookmarks0_.name as name6_0_, bookmarks0_.path as path6_0_, bookmarks0_.user_id as user7_6_0_ from user_bookmarks bookmarks0_ where bookmarks0_.user_id=?
2017-06-07 09:21:46 DEBUG Loader:1234 - Result set contains (possibly empty) collection: [com.emc.metalnx.core.domain.entity.DataGridUser.bookmarks#7]
2017-06-07 09:21:46 DEBUG CollectionLoadContext:229 - 1 collections were found in result set for role: com.emc.metalnx.core.domain.entity.DataGridUser.bookmarks
2017-06-07 09:21:46 DEBUG CollectionLoadContext:266 - Collection fully initialized: [com.emc.metalnx.core.domain.entity.DataGridUser.bookmarks#7]
2017-06-07 09:21:46 DEBUG CollectionLoadContext:236 - 1 collections initialized for role: com.emc.metalnx.core.domain.entity.DataGridUser.bookmarks
2017-06-07 09:21:46 DEBUG Loader:2109 - Done loading collection
2017-06-07 09:21:46 DEBUG Loader:2089 - Loading collection: [com.emc.metalnx.core.domain.entity.DataGridUser.favorites#6]
2017-06-07 09:21:46 DEBUG SQL:104 - select favorites0_.user_id as user7_5_1_, favorites0_.id as id7_1_, favorites0_.id as id7_0_, favorites0_.created_at as created2_7_0_, favorites0_.is_collection as is3_7_0_, favorites0_.name as name7_0_, favorites0_.path as path7_0_, favorites0_.path_hash as path6_7_0_, favorites0_.user_id as user7_7_0_ from user_favorites favorites0_ where favorites0_.user_id=?
Hibernate: select favorites0_.user_id as user7_5_1_, favorites0_.id as id7_1_, favorites0_.id as id7_0_, favorites0_.created_at as created2_7_0_, favorites0_.is_collection as is3_7_0_, favorites0_.name as name7_0_, favorites0_.path as path7_0_, favorites0_.path_hash as path6_7_0_, favorites0_.user_id as user7_7_0_ from user_favorites favorites0_ where favorites0_.user_id=?
2017-06-07 09:21:46 DEBUG Loader:1234 - Result set contains (possibly empty) collection: [com.emc.metalnx.core.domain.entity.DataGridUser.favorites#6]
2017-06-07 09:21:46 DEBUG CollectionLoadContext:229 - 1 collections were found in result set for role: com.emc.metalnx.core.domain.entity.DataGridUser.favorites
2017-06-07 09:21:46 DEBUG CollectionLoadContext:266 - Collection fully initialized: [com.emc.metalnx.core.domain.entity.DataGridUser.favorites#6]
2017-06-07 09:21:46 DEBUG CollectionLoadContext:236 - 1 collections initialized for role: com.emc.metalnx.core.domain.entity.DataGridUser.favorites
2017-06-07 09:21:46 DEBUG Loader:2109 - Done loading collection
2017-06-07 09:21:46 DEBUG Loader:2089 - Loading collection: [com.emc.metalnx.core.domain.entity.DataGridUser.bookmarks#6]
2017-06-07 09:21:46 DEBUG SQL:104 - select bookmarks0_.user_id as user7_5_1_, bookmarks0_.id as id6_1_, bookmarks0_.id as id6_0_, bookmarks0_.created_at as created2_6_0_, bookmarks0_.is_collection as is3_6_0_, bookmarks0_.is_notified as is4_6_0_, bookmarks0_.name as name6_0_, bookmarks0_.path as path6_0_, bookmarks0_.user_id as user7_6_0_ from user_bookmarks bookmarks0_ where bookmarks0_.user_id=?
Hibernate: select bookmarks0_.user_id as user7_5_1_, bookmarks0_.id as id6_1_, bookmarks0_.id as id6_0_, bookmarks0_.created_at as created2_6_0_, bookmarks0_.is_collection as is3_6_0_, bookmarks0_.is_notified as is4_6_0_, bookmarks0_.name as name6_0_, bookmarks0_.path as path6_0_, bookmarks0_.user_id as user7_6_0_ from user_bookmarks bookmarks0_ where bookmarks0_.user_id=?
2017-06-07 09:21:46 DEBUG Loader:1234 - Result set contains (possibly empty) collection: [com.emc.metalnx.core.domain.entity.DataGridUser.bookmarks#6]
2017-06-07 09:21:46 DEBUG CollectionLoadContext:229 - 1 collections were found in result set for role: com.emc.metalnx.core.domain.entity.DataGridUser.bookmarks
2017-06-07 09:21:46 DEBUG CollectionLoadContext:266 - Collection fully initialized: [com.emc.metalnx.core.domain.entity.DataGridUser.bookmarks#6]
2017-06-07 09:21:46 DEBUG CollectionLoadContext:236 - 1 collections initialized for role: com.emc.metalnx.core.domain.entity.DataGridUser.bookmarks
2017-06-07 09:21:46 DEBUG Loader:2109 - Done loading collection
2017-06-07 09:21:46 DEBUG Loader:2089 - Loading collection: [com.emc.metalnx.core.domain.entity.DataGridUser.favorites#4]
2017-06-07 09:21:46 DEBUG SQL:104 - select favorites0_.user_id as user7_5_1_, favorites0_.id as id7_1_, favorites0_.id as id7_0_, favorites0_.created_at as created2_7_0_, favorites0_.is_collection as is3_7_0_, favorites0_.name as name7_0_, favorites0_.path as path7_0_, favorites0_.path_hash as path6_7_0_, favorites0_.user_id as user7_7_0_ from user_favorites favorites0_ where favorites0_.user_id=?
Hibernate: select favorites0_.user_id as user7_5_1_, favorites0_.id as id7_1_, favorites0_.id as id7_0_, favorites0_.created_at as created2_7_0_, favorites0_.is_collection as is3_7_0_, favorites0_.name as name7_0_, favorites0_.path as path7_0_, favorites0_.path_hash as path6_7_0_, favorites0_.user_id as user7_7_0_ from user_favorites favorites0_ where favorites0_.user_id=?
2017-06-07 09:21:46 DEBUG Loader:1234 - Result set contains (possibly empty) collection: [com.emc.metalnx.core.domain.entity.DataGridUser.favorites#4]
2017-06-07 09:21:46 DEBUG CollectionLoadContext:229 - 1 collections were found in result set for role: com.emc.metalnx.core.domain.entity.DataGridUser.favorites
2017-06-07 09:21:46 DEBUG CollectionLoadContext:266 - Collection fully initialized: [com.emc.metalnx.core.domain.entity.DataGridUser.favorites#4]
2017-06-07 09:21:46 DEBUG CollectionLoadContext:236 - 1 collections initialized for role: com.emc.metalnx.core.domain.entity.DataGridUser.favorites
2017-06-07 09:21:46 DEBUG Loader:2109 - Done loading collection
2017-06-07 09:21:46 DEBUG Loader:2089 - Loading collection: [com.emc.metalnx.core.domain.entity.DataGridUser.bookmarks#4]
2017-06-07 09:21:46 DEBUG SQL:104 - select bookmarks0_.user_id as user7_5_1_, bookmarks0_.id as id6_1_, bookmarks0_.id as id6_0_, bookmarks0_.created_at as created2_6_0_, bookmarks0_.is_collection as is3_6_0_, bookmarks0_.is_notified as is4_6_0_, bookmarks0_.name as name6_0_, bookmarks0_.path as path6_0_, bookmarks0_.user_id as user7_6_0_ from user_bookmarks bookmarks0_ where bookmarks0_.user_id=?
Hibernate: select bookmarks0_.user_id as user7_5_1_, bookmarks0_.id as id6_1_, bookmarks0_.id as id6_0_, bookmarks0_.created_at as created2_6_0_, bookmarks0_.is_collection as is3_6_0_, bookmarks0_.is_notified as is4_6_0_, bookmarks0_.name as name6_0_, bookmarks0_.path as path6_0_, bookmarks0_.user_id as user7_6_0_ from user_bookmarks bookmarks0_ where bookmarks0_.user_id=?
2017-06-07 09:21:46 DEBUG Loader:1234 - Result set contains (possibly empty) collection: [com.emc.metalnx.core.domain.entity.DataGridUser.bookmarks#4]
2017-06-07 09:21:46 DEBUG CollectionLoadContext:229 - 1 collections were found in result set for role: com.emc.metalnx.core.domain.entity.DataGridUser.bookmarks
2017-06-07 09:21:46 DEBUG CollectionLoadContext:266 - Collection fully initialized: [com.emc.metalnx.core.domain.entity.DataGridUser.bookmarks#4]
2017-06-07 09:21:46 DEBUG CollectionLoadContext:236 - 1 collections initialized for role: com.emc.metalnx.core.domain.entity.DataGridUser.bookmarks
2017-06-07 09:21:46 DEBUG Loader:2109 - Done loading collection
2017-06-07 09:21:46 DEBUG Loader:2089 - Loading collection: [com.emc.metalnx.core.domain.entity.DataGridUser.favorites#3]
2017-06-07 09:21:46 DEBUG SQL:104 - select favorites0_.user_id as user7_5_1_, favorites0_.id as id7_1_, favorites0_.id as id7_0_, favorites0_.created_at as created2_7_0_, favorites0_.is_collection as is3_7_0_, favorites0_.name as name7_0_, favorites0_.path as path7_0_, favorites0_.path_hash as path6_7_0_, favorites0_.user_id as user7_7_0_ from user_favorites favorites0_ where favorites0_.user_id=?
Hibernate: select favorites0_.user_id as user7_5_1_, favorites0_.id as id7_1_, favorites0_.id as id7_0_, favorites0_.created_at as created2_7_0_, favorites0_.is_collection as is3_7_0_, favorites0_.name as name7_0_, favorites0_.path as path7_0_, favorites0_.path_hash as path6_7_0_, favorites0_.user_id as user7_7_0_ from user_favorites favorites0_ where favorites0_.user_id=?
2017-06-07 09:21:46 DEBUG Loader:1234 - Result set contains (possibly empty) collection: [com.emc.metalnx.core.domain.entity.DataGridUser.favorites#3]
2017-06-07 09:21:46 DEBUG CollectionLoadContext:229 - 1 collections were found in result set for role: com.emc.metalnx.core.domain.entity.DataGridUser.favorites
2017-06-07 09:21:46 DEBUG CollectionLoadContext:266 - Collection fully initialized: [com.emc.metalnx.core.domain.entity.DataGridUser.favorites#3]
2017-06-07 09:21:46 DEBUG CollectionLoadContext:236 - 1 collections initialized for role: com.emc.metalnx.core.domain.entity.DataGridUser.favorites
2017-06-07 09:21:46 DEBUG Loader:2109 - Done loading collection
2017-06-07 09:21:46 DEBUG Loader:2089 - Loading collection: [com.emc.metalnx.core.domain.entity.DataGridUser.bookmarks#3]
2017-06-07 09:21:46 DEBUG SQL:104 - select bookmarks0_.user_id as user7_5_1_, bookmarks0_.id as id6_1_, bookmarks0_.id as id6_0_, bookmarks0_.created_at as created2_6_0_, bookmarks0_.is_collection as is3_6_0_, bookmarks0_.is_notified as is4_6_0_, bookmarks0_.name as name6_0_, bookmarks0_.path as path6_0_, bookmarks0_.user_id as user7_6_0_ from user_bookmarks bookmarks0_ where bookmarks0_.user_id=?
Hibernate: select bookmarks0_.user_id as user7_5_1_, bookmarks0_.id as id6_1_, bookmarks0_.id as id6_0_, bookmarks0_.created_at as created2_6_0_, bookmarks0_.is_collection as is3_6_0_, bookmarks0_.is_notified as is4_6_0_, bookmarks0_.name as name6_0_, bookmarks0_.path as path6_0_, bookmarks0_.user_id as user7_6_0_ from user_bookmarks bookmarks0_ where bookmarks0_.user_id=?
2017-06-07 09:21:46 DEBUG Loader:1234 - Result set contains (possibly empty) collection: [com.emc.metalnx.core.domain.entity.DataGridUser.bookmarks#3]
2017-06-07 09:21:46 DEBUG CollectionLoadContext:229 - 1 collections were found in result set for role: com.emc.metalnx.core.domain.entity.DataGridUser.bookmarks
2017-06-07 09:21:46 DEBUG CollectionLoadContext:266 - Collection fully initialized: [com.emc.metalnx.core.domain.entity.DataGridUser.bookmarks#3]
2017-06-07 09:21:46 DEBUG CollectionLoadContext:236 - 1 collections initialized for role: com.emc.metalnx.core.domain.entity.DataGridUser.bookmarks
2017-06-07 09:21:46 DEBUG Loader:2109 - Done loading collection
2017-06-07 09:21:46 DEBUG Loader:2089 - Loading collection: [com.emc.metalnx.core.domain.entity.DataGridUser.favorites#2]
2017-06-07 09:21:46 DEBUG SQL:104 - select favorites0_.user_id as user7_5_1_, favorites0_.id as id7_1_, favorites0_.id as id7_0_, favorites0_.created_at as created2_7_0_, favorites0_.is_collection as is3_7_0_, favorites0_.name as name7_0_, favorites0_.path as path7_0_, favorites0_.path_hash as path6_7_0_, favorites0_.user_id as user7_7_0_ from user_favorites favorites0_ where favorites0_.user_id=?
Hibernate: select favorites0_.user_id as user7_5_1_, favorites0_.id as id7_1_, favorites0_.id as id7_0_, favorites0_.created_at as created2_7_0_, favorites0_.is_collection as is3_7_0_, favorites0_.name as name7_0_, favorites0_.path as path7_0_, favorites0_.path_hash as path6_7_0_, favorites0_.user_id as user7_7_0_ from user_favorites favorites0_ where favorites0_.user_id=?
2017-06-07 09:21:46 DEBUG Loader:1234 - Result set contains (possibly empty) collection: [com.emc.metalnx.core.domain.entity.DataGridUser.favorites#2]
2017-06-07 09:21:46 DEBUG CollectionLoadContext:229 - 1 collections were found in result set for role: com.emc.metalnx.core.domain.entity.DataGridUser.favorites
2017-06-07 09:21:46 DEBUG CollectionLoadContext:266 - Collection fully initialized: [com.emc.metalnx.core.domain.entity.DataGridUser.favorites#2]
2017-06-07 09:21:46 DEBUG CollectionLoadContext:236 - 1 collections initialized for role: com.emc.metalnx.core.domain.entity.DataGridUser.favorites
2017-06-07 09:21:46 DEBUG Loader:2109 - Done loading collection
2017-06-07 09:21:46 DEBUG Loader:2089 - Loading collection: [com.emc.metalnx.core.domain.entity.DataGridUser.bookmarks#2]
2017-06-07 09:21:46 DEBUG SQL:104 - select bookmarks0_.user_id as user7_5_1_, bookmarks0_.id as id6_1_, bookmarks0_.id as id6_0_, bookmarks0_.created_at as created2_6_0_, bookmarks0_.is_collection as is3_6_0_, bookmarks0_.is_notified as is4_6_0_, bookmarks0_.name as name6_0_, bookmarks0_.path as path6_0_, bookmarks0_.user_id as user7_6_0_ from user_bookmarks bookmarks0_ where bookmarks0_.user_id=?
Hibernate: select bookmarks0_.user_id as user7_5_1_, bookmarks0_.id as id6_1_, bookmarks0_.id as id6_0_, bookmarks0_.created_at as created2_6_0_, bookmarks0_.is_collection as is3_6_0_, bookmarks0_.is_notified as is4_6_0_, bookmarks0_.name as name6_0_, bookmarks0_.path as path6_0_, bookmarks0_.user_id as user7_6_0_ from user_bookmarks bookmarks0_ where bookmarks0_.user_id=?
2017-06-07 09:21:46 DEBUG Loader:1234 - Result set contains (possibly empty) collection: [com.emc.metalnx.core.domain.entity.DataGridUser.bookmarks#2]
2017-06-07 09:21:46 DEBUG CollectionLoadContext:229 - 1 collections were found in result set for role: com.emc.metalnx.core.domain.entity.DataGridUser.bookmarks
2017-06-07 09:21:46 DEBUG CollectionLoadContext:266 - Collection fully initialized: [com.emc.metalnx.core.domain.entity.DataGridUser.bookmarks#2]
2017-06-07 09:21:46 DEBUG CollectionLoadContext:236 - 1 collections initialized for role: com.emc.metalnx.core.domain.entity.DataGridUser.bookmarks
2017-06-07 09:21:46 DEBUG Loader:2109 - Done loading collection
2017-06-07 09:21:46 DEBUG Loader:2089 - Loading collection: [com.emc.metalnx.core.domain.entity.DataGridUser.favorites#1]
2017-06-07 09:21:46 DEBUG SQL:104 - select favorites0_.user_id as user7_5_1_, favorites0_.id as id7_1_, favorites0_.id as id7_0_, favorites0_.created_at as created2_7_0_, favorites0_.is_collection as is3_7_0_, favorites0_.name as name7_0_, favorites0_.path as path7_0_, favorites0_.path_hash as path6_7_0_, favorites0_.user_id as user7_7_0_ from user_favorites favorites0_ where favorites0_.user_id=?
Hibernate: select favorites0_.user_id as user7_5_1_, favorites0_.id as id7_1_, favorites0_.id as id7_0_, favorites0_.created_at as created2_7_0_, favorites0_.is_collection as is3_7_0_, favorites0_.name as name7_0_, favorites0_.path as path7_0_, favorites0_.path_hash as path6_7_0_, favorites0_.user_id as user7_7_0_ from user_favorites favorites0_ where favorites0_.user_id=?
2017-06-07 09:21:46 DEBUG Loader:1234 - Result set contains (possibly empty) collection: [com.emc.metalnx.core.domain.entity.DataGridUser.favorites#1]
2017-06-07 09:21:46 DEBUG CollectionLoadContext:229 - 1 collections were found in result set for role: com.emc.metalnx.core.domain.entity.DataGridUser.favorites
2017-06-07 09:21:46 DEBUG CollectionLoadContext:266 - Collection fully initialized: [com.emc.metalnx.core.domain.entity.DataGridUser.favorites#1]
2017-06-07 09:21:46 DEBUG CollectionLoadContext:236 - 1 collections initialized for role: com.emc.metalnx.core.domain.entity.DataGridUser.favorites
2017-06-07 09:21:46 DEBUG Loader:2109 - Done loading collection
2017-06-07 09:21:46 DEBUG Loader:2089 - Loading collection: [com.emc.metalnx.core.domain.entity.DataGridUser.bookmarks#1]
2017-06-07 09:21:46 DEBUG SQL:104 - select bookmarks0_.user_id as user7_5_1_, bookmarks0_.id as id6_1_, bookmarks0_.id as id6_0_, bookmarks0_.created_at as created2_6_0_, bookmarks0_.is_collection as is3_6_0_, bookmarks0_.is_notified as is4_6_0_, bookmarks0_.name as name6_0_, bookmarks0_.path as path6_0_, bookmarks0_.user_id as user7_6_0_ from user_bookmarks bookmarks0_ where bookmarks0_.user_id=?
Hibernate: select bookmarks0_.user_id as user7_5_1_, bookmarks0_.id as id6_1_, bookmarks0_.id as id6_0_, bookmarks0_.created_at as created2_6_0_, bookmarks0_.is_collection as is3_6_0_, bookmarks0_.is_notified as is4_6_0_, bookmarks0_.name as name6_0_, bookmarks0_.path as path6_0_, bookmarks0_.user_id as user7_6_0_ from user_bookmarks bookmarks0_ where bookmarks0_.user_id=?
2017-06-07 09:21:46 DEBUG Loader:1234 - Result set contains (possibly empty) collection: [com.emc.metalnx.core.domain.entity.DataGridUser.bookmarks#1]
2017-06-07 09:21:46 DEBUG CollectionLoadContext:229 - 1 collections were found in result set for role: com.emc.metalnx.core.domain.entity.DataGridUser.bookmarks
2017-06-07 09:21:46 DEBUG CollectionLoadContext:266 - Collection fully initialized: [com.emc.metalnx.core.domain.entity.DataGridUser.bookmarks#1]
2017-06-07 09:21:46 DEBUG CollectionLoadContext:236 - 1 collections initialized for role: com.emc.metalnx.core.domain.entity.DataGridUser.bookmarks
2017-06-07 09:21:46 DEBUG Loader:2109 - Done loading collection
2017-06-07 09:21:46 DEBUG HibernateTransactionManager:755 - Initiating transaction commit
2017-06-07 09:21:46 DEBUG HibernateTransactionManager:554 - Committing Hibernate transaction on Session [SessionImpl(PersistenceContext[entityKeys=[EntityKey[com.emc.metalnx.core.domain.entity.DataGridUser#3], EntityKey[com.emc.metalnx.core.domain.entity.DataGridUser#4], EntityKey[com.emc.metalnx.core.domain.entity.DataGridUser#1], EntityKey[com.emc.metalnx.core.domain.entity.DataGridUser#2], EntityKey[com.emc.metalnx.core.domain.entity.DataGridUser#7], EntityKey[com.emc.metalnx.core.domain.entity.DataGridUser#8], EntityKey[com.emc.metalnx.core.domain.entity.DataGridUser#6], EntityKey[com.emc.metalnx.core.domain.entity.DataGridUser#11], EntityKey[com.emc.metalnx.core.domain.entity.DataGridUser#12], EntityKey[com.emc.metalnx.core.domain.entity.DataGridUser#9], EntityKey[com.emc.metalnx.core.domain.entity.DataGridUser#10], EntityKey[com.emc.metalnx.core.domain.entity.DataGridUser#13], EntityKey[com.emc.metalnx.core.domain.entity.DataGridUser#52], EntityKey[com.emc.metalnx.core.domain.entity.DataGridUser#53]],collectionKeys=[CollectionKey[com.emc.metalnx.core.domain.entity.DataGridUser.bookmarks#1], CollectionKey[com.emc.metalnx.core.domain.entity.DataGridUser.bookmarks#3], CollectionKey[com.emc.metalnx.core.domain.entity.DataGridUser.bookmarks#2], CollectionKey[com.emc.metalnx.core.domain.entity.DataGridUser.bookmarks#4], CollectionKey[com.emc.metalnx.core.domain.entity.DataGridUser.favorites#6], CollectionKey[com.emc.metalnx.core.domain.entity.DataGridUser.favorites#7], CollectionKey[com.emc.metalnx.core.domain.entity.DataGridUser.favorites#4], CollectionKey[com.emc.metalnx.core.domain.entity.DataGridUser.favorites#10], CollectionKey[com.emc.metalnx.core.domain.entity.DataGridUser.favorites#11], CollectionKey[com.emc.metalnx.core.domain.entity.DataGridUser.favorites#8], CollectionKey[com.emc.metalnx.core.domain.entity.DataGridUser.favorites#9], CollectionKey[com.emc.metalnx.core.domain.entity.DataGridUser.favorites#12], CollectionKey[com.emc.metalnx.core.domain.entity.DataGridUser.favorites#13], CollectionKey[com.emc.metalnx.core.domain.entity.DataGridUser.bookmarks#53], CollectionKey[com.emc.metalnx.core.domain.entity.DataGridUser.bookmarks#52], CollectionKey[com.emc.metalnx.core.domain.entity.DataGridUser.favorites#52], CollectionKey[com.emc.metalnx.core.domain.entity.DataGridUser.favorites#53], CollectionKey[com.emc.metalnx.core.domain.entity.DataGridUser.favorites#2], CollectionKey[com.emc.metalnx.core.domain.entity.DataGridUser.favorites#3], CollectionKey[com.emc.metalnx.core.domain.entity.DataGridUser.favorites#1], CollectionKey[com.emc.metalnx.core.domain.entity.DataGridUser.bookmarks#7], CollectionKey[com.emc.metalnx.core.domain.entity.DataGridUser.bookmarks#6], CollectionKey[com.emc.metalnx.core.domain.entity.DataGridUser.bookmarks#9], CollectionKey[com.emc.metalnx.core.domain.entity.DataGridUser.bookmarks#8], CollectionKey[com.emc.metalnx.core.domain.entity.DataGridUser.bookmarks#11], CollectionKey[com.emc.metalnx.core.domain.entity.DataGridUser.bookmarks#10], CollectionKey[com.emc.metalnx.core.domain.entity.DataGridUser.bookmarks#13], CollectionKey[com.emc.metalnx.core.domain.entity.DataGridUser.bookmarks#12]]];ActionQueue[insertions=[] updates=[] deletions=[] collectionCreations=[] collectionRemovals=[] collectionUpdates=[] unresolvedInsertDependencies=UnresolvedEntityInsertActions[]])]
2017-06-07 09:21:46 DEBUG AbstractTransactionImpl:173 - committing
2017-06-07 09:21:46 DEBUG AbstractFlushingEventListener:143 - Processing flush-time cascades
2017-06-07 09:21:46 DEBUG AbstractFlushingEventListener:183 - Dirty checking collections
2017-06-07 09:21:46 DEBUG Collections:191 - Collection found: [com.emc.metalnx.core.domain.entity.DataGridUser.bookmarks#1], was: [com.emc.metalnx.core.domain.entity.DataGridUser.bookmarks#1] (initialized)
2017-06-07 09:21:46 DEBUG Collections:191 - Collection found: [com.emc.metalnx.core.domain.entity.DataGridUser.favorites#1], was: [com.emc.metalnx.core.domain.entity.DataGridUser.favorites#1] (initialized)
2017-06-07 09:21:46 DEBUG Collections:191 - Collection found: [com.emc.metalnx.core.domain.entity.DataGridUser.bookmarks#2], was: [com.emc.metalnx.core.domain.entity.DataGridUser.bookmarks#2] (initialized)
2017-06-07 09:21:46 DEBUG Collections:191 - Collection found: [com.emc.metalnx.core.domain.entity.DataGridUser.favorites#2], was: [com.emc.metalnx.core.domain.entity.DataGridUser.favorites#2] (initialized)
2017-06-07 09:21:46 DEBUG Collections:191 - Collection found: [com.emc.metalnx.core.domain.entity.DataGridUser.bookmarks#3], was: [com.emc.metalnx.core.domain.entity.DataGridUser.bookmarks#3] (initialized)
2017-06-07 09:21:46 DEBUG Collections:191 - Collection found: [com.emc.metalnx.core.domain.entity.DataGridUser.favorites#3], was: [com.emc.metalnx.core.domain.entity.DataGridUser.favorites#3] (initialized)
2017-06-07 09:21:46 DEBUG Collections:191 - Collection found: [com.emc.metalnx.core.domain.entity.DataGridUser.bookmarks#4], was: [com.emc.metalnx.core.domain.entity.DataGridUser.bookmarks#4] (initialized)
2017-06-07 09:21:46 DEBUG Collections:191 - Collection found: [com.emc.metalnx.core.domain.entity.DataGridUser.favorites#4], was: [com.emc.metalnx.core.domain.entity.DataGridUser.favorites#4] (initialized)
2017-06-07 09:21:46 DEBUG Collections:191 - Collection found: [com.emc.metalnx.core.domain.entity.DataGridUser.bookmarks#6], was: [com.emc.metalnx.core.domain.entity.DataGridUser.bookmarks#6] (initialized)
2017-06-07 09:21:46 DEBUG Collections:191 - Collection found: [com.emc.metalnx.core.domain.entity.DataGridUser.favorites#6], was: [com.emc.metalnx.core.domain.entity.DataGridUser.favorites#6] (initialized)
2017-06-07 09:21:46 DEBUG Collections:191 - Collection found: [com.emc.metalnx.core.domain.entity.DataGridUser.bookmarks#7], was: [com.emc.metalnx.core.domain.entity.DataGridUser.bookmarks#7] (initialized)
2017-06-07 09:21:46 DEBUG Collections:191 - Collection found: [com.emc.metalnx.core.domain.entity.DataGridUser.favorites#7], was: [com.emc.metalnx.core.domain.entity.DataGridUser.favorites#7] (initialized)
2017-06-07 09:21:46 DEBUG Collections:191 - Collection found: [com.emc.metalnx.core.domain.entity.DataGridUser.bookmarks#8], was: [com.emc.metalnx.core.domain.entity.DataGridUser.bookmarks#8] (initialized)
2017-06-07 09:21:46 DEBUG Collections:191 - Collection found: [com.emc.metalnx.core.domain.entity.DataGridUser.favorites#8], was: [com.emc.metalnx.core.domain.entity.DataGridUser.favorites#8] (initialized)
2017-06-07 09:21:46 DEBUG Collections:191 - Collection found: [com.emc.metalnx.core.domain.entity.DataGridUser.bookmarks#9], was: [com.emc.metalnx.core.domain.entity.DataGridUser.bookmarks#9] (initialized)
2017-06-07 09:21:46 DEBUG Collections:191 - Collection found: [com.emc.metalnx.core.domain.entity.DataGridUser.favorites#9], was: [com.emc.metalnx.core.domain.entity.DataGridUser.favorites#9] (initialized)
2017-06-07 09:21:46 DEBUG Collections:191 - Collection found: [com.emc.metalnx.core.domain.entity.DataGridUser.bookmarks#10], was: [com.emc.metalnx.core.domain.entity.DataGridUser.bookmarks#10] (initialized)
2017-06-07 09:21:46 DEBUG Collections:191 - Collection found: [com.emc.metalnx.core.domain.entity.DataGridUser.favorites#10], was: [com.emc.metalnx.core.domain.entity.DataGridUser.favorites#10] (initialized)
2017-06-07 09:21:46 DEBUG Collections:191 - Collection found: [com.emc.metalnx.core.domain.entity.DataGridUser.bookmarks#11], was: [com.emc.metalnx.core.domain.entity.DataGridUser.bookmarks#11] (initialized)
2017-06-07 09:21:46 DEBUG Collections:191 - Collection found: [com.emc.metalnx.core.domain.entity.DataGridUser.favorites#11], was: [com.emc.metalnx.core.domain.entity.DataGridUser.favorites#11] (initialized)
2017-06-07 09:21:46 DEBUG Collections:191 - Collection found: [com.emc.metalnx.core.domain.entity.DataGridUser.bookmarks#12], was: [com.emc.metalnx.core.domain.entity.DataGridUser.bookmarks#12] (initialized)
2017-06-07 09:21:46 DEBUG Collections:191 - Collection found: [com.emc.metalnx.core.domain.entity.DataGridUser.favorites#12], was: [com.emc.metalnx.core.domain.entity.DataGridUser.favorites#12] (initialized)
2017-06-07 09:21:46 DEBUG Collections:191 - Collection found: [com.emc.metalnx.core.domain.entity.DataGridUser.bookmarks#13], was: [com.emc.metalnx.core.domain.entity.DataGridUser.bookmarks#13] (initialized)
2017-06-07 09:21:46 DEBUG Collections:191 - Collection found: [com.emc.metalnx.core.domain.entity.DataGridUser.favorites#13], was: [com.emc.metalnx.core.domain.entity.DataGridUser.favorites#13] (initialized)
2017-06-07 09:21:46 DEBUG Collections:191 - Collection found: [com.emc.metalnx.core.domain.entity.DataGridUser.bookmarks#52], was: [com.emc.metalnx.core.domain.entity.DataGridUser.bookmarks#52] (initialized)
2017-06-07 09:21:46 DEBUG Collections:191 - Collection found: [com.emc.metalnx.core.domain.entity.DataGridUser.favorites#52], was: [com.emc.metalnx.core.domain.entity.DataGridUser.favorites#52] (initialized)
2017-06-07 09:21:46 DEBUG Collections:191 - Collection found: [com.emc.metalnx.core.domain.entity.DataGridUser.bookmarks#53], was: [com.emc.metalnx.core.domain.entity.DataGridUser.bookmarks#53] (initialized)
2017-06-07 09:21:46 DEBUG Collections:191 - Collection found: [com.emc.metalnx.core.domain.entity.DataGridUser.favorites#53], was: [com.emc.metalnx.core.domain.entity.DataGridUser.favorites#53] (initialized)
2017-06-07 09:21:46 DEBUG AbstractFlushingEventListener:117 - Flushed: 0 insertions, 0 updates, 0 deletions to 14 objects
2017-06-07 09:21:46 DEBUG AbstractFlushingEventListener:124 - Flushed: 0 (re)creations, 0 updates, 0 removals to 28 collections
2017-06-07 09:21:46 DEBUG EntityPrinter:114 - Listing entities:
2017-06-07 09:21:46 DEBUG EntityPrinter:121 - com.emc.metalnx.core.domain.entity.DataGridUser{favorites=[], lastName=null, forceFileOverwriting=false, dataGridId=10022, locale=en, title=null, enabled=true, userProfile=null, organizationalRole=null, bookmarks=[], firstName=null, password=null, additionalInfo=tempZone, company=null, id=3, userType=rodsuser, department=null, email=null, username=bdvanschaik}
2017-06-07 09:21:46 DEBUG EntityPrinter:121 - com.emc.metalnx.core.domain.entity.DataGridUser{favorites=[], lastName=null, forceFileOverwriting=false, dataGridId=10025, locale=en, title=null, enabled=true, userProfile=null, organizationalRole=null, bookmarks=[], firstName=null, password=null, additionalInfo=tempZone, company=null, id=4, userType=rodsuser, department=null, email=null, username=foliveiragutierrez}
2017-06-07 09:21:46 DEBUG EntityPrinter:121 - com.emc.metalnx.core.domain.entity.DataGridUser{favorites=[], lastName=null, forceFileOverwriting=false, dataGridId=10016, locale=en, title=null, enabled=true, userProfile=null, organizationalRole=null, bookmarks=[], firstName=null, password=null, additionalInfo=tempZone, company=null, id=1, userType=rodsuser, department=null, email=null, username=ugp-immuno}
2017-06-07 09:21:46 DEBUG EntityPrinter:121 - com.emc.metalnx.core.domain.entity.DataGridUser{favorites=[], lastName=null, forceFileOverwriting=false, dataGridId=10019, locale=en, title=null, enabled=true, userProfile=null, organizationalRole=null, bookmarks=[], firstName=null, password=null, additionalInfo=tempZone, company=null, id=2, userType=rodsuser, department=null, email=null, username=ajongejan}
2017-06-07 09:21:46 DEBUG EntityPrinter:121 - com.emc.metalnx.core.domain.entity.DataGridUser{favorites=[], lastName=null, forceFileOverwriting=false, dataGridId=10031, locale=en, title=null, enabled=true, userProfile=null, organizationalRole=null, bookmarks=[], firstName=null, password=null, additionalInfo=tempZone, company=null, id=7, userType=rodsuser, department=null, email=null, username=sdolabarriaga}
2017-06-07 09:21:46 DEBUG EntityPrinter:121 - com.emc.metalnx.core.domain.entity.DataGridUser{favorites=[], lastName=null, forceFileOverwriting=false, dataGridId=10001, locale=en, title=null, enabled=true, userProfile=null, organizationalRole=null, bookmarks=[], firstName=null, password=null, additionalInfo=tempZone, company=null, id=8, userType=rodsadmin, department=null, email=null, username=pi-repmed}
2017-06-07 09:21:46 DEBUG EntityPrinter:121 - com.emc.metalnx.core.domain.entity.DataGridUser{favorites=[], lastName=null, forceFileOverwriting=false, dataGridId=10028, locale=en, title=null, enabled=true, userProfile=null, organizationalRole=null, bookmarks=[], firstName=null, password=null, additionalInfo=tempZone, company=null, id=6, userType=rodsuser, department=null, email=null, username=pfdegeest}
2017-06-07 09:21:46 DEBUG EntityPrinter:121 - com.emc.metalnx.core.domain.entity.DataGridUser{favorites=[], lastName=null, forceFileOverwriting=false, dataGridId=10007, locale=en, title=null, enabled=true, userProfile=null, organizationalRole=null, bookmarks=[], firstName=null, password=null, additionalInfo=tempZone, company=null, id=11, userType=rodsadmin, department=null, email=null, username=ds-repmed}
2017-06-07 09:21:46 DEBUG EntityPrinter:121 - com.emc.metalnx.core.domain.entity.DataGridUser{favorites=[], lastName=null, forceFileOverwriting=false, dataGridId=10010, locale=en, title=null, enabled=true, userProfile=null, organizationalRole=null, bookmarks=[], firstName=null, password=null, additionalInfo=tempZone, company=null, id=12, userType=rodsadmin, department=null, email=null, username=ds-immuno}
2017-06-07 09:21:46 DEBUG EntityPrinter:121 - com.emc.metalnx.core.domain.entity.DataGridUser{favorites=[], lastName=null, forceFileOverwriting=false, dataGridId=9010, locale=en, title=null, enabled=true, userProfile=null, organizationalRole=null, bookmarks=[], firstName=null, password=null, additionalInfo=tempZone, company=null, id=9, userType=rodsadmin, department=null, email=null, username=rods}
2017-06-07 09:21:46 DEBUG EntityPrinter:121 - com.emc.metalnx.core.domain.entity.DataGridUser{favorites=[], lastName=null, forceFileOverwriting=false, dataGridId=10004, locale=en, title=null, enabled=true, userProfile=null, organizationalRole=null, bookmarks=[], firstName=null, password=null, additionalInfo=tempZone, company=null, id=10, userType=rodsadmin, department=null, email=null, username=pi-immuno}
2017-06-07 09:21:46 DEBUG EntityPrinter:121 - com.emc.metalnx.core.domain.entity.DataGridUser{favorites=[], lastName=null, forceFileOverwriting=false, dataGridId=10013, locale=en, title=null, enabled=true, userProfile=null, organizationalRole=null, bookmarks=[], firstName=null, password=null, additionalInfo=tempZone, company=null, id=13, userType=rodsuser, department=null, email=null, username=ugp-repmed}
2017-06-07 09:21:46 DEBUG EntityPrinter:121 - com.emc.metalnx.core.domain.entity.DataGridUser{favorites=[], lastName=null, forceFileOverwriting=false, dataGridId=15785, locale=en, title=null, enabled=true, userProfile=null, organizationalRole=null, bookmarks=[], firstName=null, password=null, additionalInfo=tempZone, company=null, id=52, userType=rodsuser, department=null, email=null, username=ugp-test}
2017-06-07 09:21:46 DEBUG EntityPrinter:121 - com.emc.metalnx.core.domain.entity.DataGridUser{favorites=[], lastName=null, forceFileOverwriting=false, dataGridId=35404, locale=en, title=null, enabled=true, userProfile=null, organizationalRole=null, bookmarks=[], firstName=null, password=null, additionalInfo=tempZone, company=null, id=53, userType=rodsuser, department=null, email=null, username=felipe}
2017-06-07 09:21:46 DEBUG JdbcTransaction:113 - committed JDBC Connection
2017-06-07 09:21:46 DEBUG JdbcTransaction:126 - re-enabling autocommit
2017-06-07 09:21:46 DEBUG HibernateTransactionManager:636 - Closing Hibernate Session [SessionImpl(PersistenceContext[entityKeys=[EntityKey[com.emc.metalnx.core.domain.entity.DataGridUser#3], EntityKey[com.emc.metalnx.core.domain.entity.DataGridUser#4], EntityKey[com.emc.metalnx.core.domain.entity.DataGridUser#1], EntityKey[com.emc.metalnx.core.domain.entity.DataGridUser#2], EntityKey[com.emc.metalnx.core.domain.entity.DataGridUser#7], EntityKey[com.emc.metalnx.core.domain.entity.DataGridUser#8], EntityKey[com.emc.metalnx.core.domain.entity.DataGridUser#6], EntityKey[com.emc.metalnx.core.domain.entity.DataGridUser#11], EntityKey[com.emc.metalnx.core.domain.entity.DataGridUser#12], EntityKey[com.emc.metalnx.core.domain.entity.DataGridUser#9], EntityKey[com.emc.metalnx.core.domain.entity.DataGridUser#10], EntityKey[com.emc.metalnx.core.domain.entity.DataGridUser#13], EntityKey[com.emc.metalnx.core.domain.entity.DataGridUser#52], EntityKey[com.emc.metalnx.core.domain.entity.DataGridUser#53]],collectionKeys=[CollectionKey[com.emc.metalnx.core.domain.entity.DataGridUser.bookmarks#1], CollectionKey[com.emc.metalnx.core.domain.entity.DataGridUser.bookmarks#3], CollectionKey[com.emc.metalnx.core.domain.entity.DataGridUser.bookmarks#2], CollectionKey[com.emc.metalnx.core.domain.entity.DataGridUser.bookmarks#4], CollectionKey[com.emc.metalnx.core.domain.entity.DataGridUser.favorites#6], CollectionKey[com.emc.metalnx.core.domain.entity.DataGridUser.favorites#7], CollectionKey[com.emc.metalnx.core.domain.entity.DataGridUser.favorites#4], CollectionKey[com.emc.metalnx.core.domain.entity.DataGridUser.favorites#10], CollectionKey[com.emc.metalnx.core.domain.entity.DataGridUser.favorites#11], CollectionKey[com.emc.metalnx.core.domain.entity.DataGridUser.favorites#8], CollectionKey[com.emc.metalnx.core.domain.entity.DataGridUser.favorites#9], CollectionKey[com.emc.metalnx.core.domain.entity.DataGridUser.favorites#12], CollectionKey[com.emc.metalnx.core.domain.entity.DataGridUser.favorites#13], CollectionKey[com.emc.metalnx.core.domain.entity.DataGridUser.bookmarks#53], CollectionKey[com.emc.metalnx.core.domain.entity.DataGridUser.bookmarks#52], CollectionKey[com.emc.metalnx.core.domain.entity.DataGridUser.favorites#52], CollectionKey[com.emc.metalnx.core.domain.entity.DataGridUser.favorites#53], CollectionKey[com.emc.metalnx.core.domain.entity.DataGridUser.favorites#2], CollectionKey[com.emc.metalnx.core.domain.entity.DataGridUser.favorites#3], CollectionKey[com.emc.metalnx.core.domain.entity.DataGridUser.favorites#1], CollectionKey[com.emc.metalnx.core.domain.entity.DataGridUser.bookmarks#7], CollectionKey[com.emc.metalnx.core.domain.entity.DataGridUser.bookmarks#6], CollectionKey[com.emc.metalnx.core.domain.entity.DataGridUser.bookmarks#9], CollectionKey[com.emc.metalnx.core.domain.entity.DataGridUser.bookmarks#8], CollectionKey[com.emc.metalnx.core.domain.entity.DataGridUser.bookmarks#11], CollectionKey[com.emc.metalnx.core.domain.entity.DataGridUser.bookmarks#10], CollectionKey[com.emc.metalnx.core.domain.entity.DataGridUser.bookmarks#13], CollectionKey[com.emc.metalnx.core.domain.entity.DataGridUser.bookmarks#12]]];ActionQueue[insertions=[] updates=[] deletions=[] collectionCreations=[] collectionRemovals=[] collectionUpdates=[] unresolvedInsertDependencies=UnresolvedEntityInsertActions[]])] after transaction
2017-06-07 09:21:46 DEBUG LogicalConnectionImpl:314 - Releasing JDBC connection
2017-06-07 09:21:46 DEBUG LogicalConnectionImpl:332 - Released JDBC connection
2017-06-07 09:21:46 DEBUG ConnectionProxyHandler:219 - HHH000163: Logical connection releasing its physical connection
2017-06-07 09:21:46 DEBUG ConnectionProxyHandler:219 - HHH000163: Logical connection releasing its physical connection
2017-06-07 09:21:46 DEBUG ConnectionProxyHandler:219 - HHH000163: Logical connection releasing its physical connection
2017-06-07 09:21:46 DEBUG ConnectionProxyHandler:219 - HHH000163: Logical connection releasing its physical connection
2017-06-07 09:21:46 DEBUG IRODSAccessObjectFactoryImpl:230 - creating access object factory
2017-06-07 09:21:46 DEBUG IRODSGenericAO:64 - establishing connection
2017-06-07 09:21:46 DEBUG IRODSSession:418 - session using previously established connection:AbstractIRODSMidLevelProtocol [irodsConnection=IRODSBasicTCPConnection [], irodsProtocolManager=org.irods.jargon.core.connection.IRODSSimpleProtocolManager@55ec6d47, irodsServerProperties=org.irods.jargon.core.connection.IRODSServerProperties@5b9a98e3, irodsSession=org.irods.jargon.core.connection.IRODSSession@7a65857, startupResponseData=StartupResponseData:
status:0
relVersion:rods4.1.10
apiVersion:d
reconnPort:0
reconnAddr:
cookie:400, forceSslFlush=false, log=org.slf4j.impl.Log4jLoggerAdapter(org.irods.jargon.core.connection.AbstractIRODSMidLevelProtocol), authResponse=AuthResponse [successful=true, authMessage=, authenticatingIRODSAccount=irods://rods@irodsprodvm.ebioscience.amc.nl:1247, authenticatedIRODSAccount=irods://rods@irodsprodvm.ebioscience.amc.nl:1247, responseProperties=[], startupResponse=StartupResponseData:
status:0
relVersion:rods4.1.10
apiVersion:d
reconnPort:0
reconnAddr:
cookie:400], irodsAccount=irods://rods@irodsprodvm.ebioscience.amc.nl:1247]
2017-06-07 09:21:46 DEBUG IRODSAccessObjectFactoryImpl:230 - creating access object factory
2017-06-07 09:21:46 DEBUG IRODSAccessObjectFactoryImpl:230 - creating access object factory
2017-06-07 09:21:46 DEBUG IRODSGenericAO:64 - establishing connection
2017-06-07 09:21:46 DEBUG IRODSSession:418 - session using previously established connection:AbstractIRODSMidLevelProtocol [irodsConnection=IRODSBasicTCPConnection [], irodsProtocolManager=org.irods.jargon.core.connection.IRODSSimpleProtocolManager@55ec6d47, irodsServerProperties=org.irods.jargon.core.connection.IRODSServerProperties@5b9a98e3, irodsSession=org.irods.jargon.core.connection.IRODSSession@7a65857, startupResponseData=StartupResponseData:
status:0
relVersion:rods4.1.10
apiVersion:d
reconnPort:0
reconnAddr:
cookie:400, forceSslFlush=false, log=org.slf4j.impl.Log4jLoggerAdapter(org.irods.jargon.core.connection.AbstractIRODSMidLevelProtocol), authResponse=AuthResponse [successful=true, authMessage=, authenticatingIRODSAccount=irods://rods@irodsprodvm.ebioscience.amc.nl:1247, authenticatedIRODSAccount=irods://rods@irodsprodvm.ebioscience.amc.nl:1247, responseProperties=[], startupResponse=StartupResponseData:
status:0
relVersion:rods4.1.10
apiVersion:d
reconnPort:0
reconnAddr:
cookie:400], irodsAccount=irods://rods@irodsprodvm.ebioscience.amc.nl:1247]
2017-06-07 09:21:46 INFO IRODSGenQueryExecutorImpl:123 - executeIRODSQueryAndCloseResult()
2017-06-07 09:21:46 INFO IRODSGenQueryExecutorImpl:142 - executeIRODSQueryAndCloseResultInZone()
2017-06-07 09:21:46 INFO IRODSGenQueryExecutorImpl:152 - query: org.irods.jargon.core.query.IRODSGenQueryFromBuilder@8950ba5
2017-06-07 09:21:46 DEBUG IRODSSession:418 - session using previously established connection:AbstractIRODSMidLevelProtocol [irodsConnection=IRODSBasicTCPConnection [], irodsProtocolManager=org.irods.jargon.core.connection.IRODSSimpleProtocolManager@55ec6d47, irodsServerProperties=org.irods.jargon.core.connection.IRODSServerProperties@5b9a98e3, irodsSession=org.irods.jargon.core.connection.IRODSSession@7a65857, startupResponseData=StartupResponseData:
status:0
relVersion:rods4.1.10
apiVersion:d
reconnPort:0
reconnAddr:
cookie:400, forceSslFlush=false, log=org.slf4j.impl.Log4jLoggerAdapter(org.irods.jargon.core.connection.AbstractIRODSMidLevelProtocol), authResponse=AuthResponse [successful=true, authMessage=, authenticatingIRODSAccount=irods://rods@irodsprodvm.ebioscience.amc.nl:1247, authenticatedIRODSAccount=irods://rods@irodsprodvm.ebioscience.amc.nl:1247, responseProperties=[], startupResponse=StartupResponseData:
status:0
relVersion:rods4.1.10
apiVersion:d
reconnPort:0
reconnAddr:
cookie:400], irodsAccount=irods://rods@irodsprodvm.ebioscience.amc.nl:1247]
2017-06-07 09:21:46 DEBUG IRODSMidLevelProtocol:170 - calling irods function with byte array
2017-06-07 09:21:46 DEBUG IRODSMidLevelProtocol:173 - calling irods function with:<GenQueryInp_PI><maxRows>5000</maxRows>
<continueInx>0</continueInx>
<partialStartIndex>0</partialStartIndex>
<options>0</options>
<KeyValPair_PI><ssLen>0</ssLen>
</KeyValPair_PI>
<InxIvalPair_PI><iiLen>8</iiLen>
<inx>204</inx>
<inx>202</inx>
<inx>201</inx>
<inx>203</inx>
<inx>206</inx>
<inx>207</inx>
<inx>208</inx>
<inx>209</inx>
<ivalue>1024</ivalue>
<ivalue>1024</ivalue>
<ivalue>1</ivalue>
<ivalue>1</ivalue>
<ivalue>1</ivalue>
<ivalue>1</ivalue>
<ivalue>1</ivalue>
<ivalue>1</ivalue>
</InxIvalPair_PI>
<InxValPair_PI><isLen>0</isLen>
</InxValPair_PI>
</GenQueryInp_PI>
2017-06-07 09:21:46 DEBUG IRODSMidLevelProtocol:176 - api number is:702
2017-06-07 09:21:46 DEBUG AbstractIRODSMidLevelProtocol:706 - reading message from irods
2017-06-07 09:21:46 DEBUG AbstractConnection:673 - IRODSConnection.read, byte array size = 4
2017-06-07 09:21:46 DEBUG AbstractConnection:675 - offset = 0
2017-06-07 09:21:46 DEBUG AbstractConnection:676 - length = 4
2017-06-07 09:21:46 DEBUG AbstractConnection:673 - IRODSConnection.read, byte array size = 142
2017-06-07 09:21:46 DEBUG AbstractConnection:675 - offset = 0
2017-06-07 09:21:46 DEBUG AbstractConnection:676 - length = 142
2017-06-07 09:21:46 DEBUG AbstractIRODSMidLevelProtocol:716 - message length:7238
2017-06-07 09:21:46 DEBUG AbstractIRODSMidLevelProtocol:717 - error length:0
2017-06-07 09:21:46 DEBUG AbstractIRODSMidLevelProtocol:718 - bytesLength:0
2017-06-07 09:21:46 DEBUG AbstractIRODSMidLevelProtocol:719 - info value:0
2017-06-07 09:21:46 DEBUG AbstractIRODSMidLevelProtocol:731 - message length greater than zero
2017-06-07 09:21:46 DEBUG AbstractConnection:673 - IRODSConnection.read, byte array size = 7238
2017-06-07 09:21:46 DEBUG AbstractConnection:675 - offset = 0
2017-06-07 09:21:46 DEBUG AbstractConnection:676 - length = 7238
2017-06-07 09:21:46 INFO GenQueryProcessor:90 - continuation value: 0
2017-06-07 09:21:46 INFO GenQueryProcessor:101 - total records:0
2017-06-07 09:21:46 INFO QueryResultProcessingUtils:62 - rows returned from iRODS query: 19
2017-06-07 09:21:46 DEBUG QueryResultProcessingUtils:76 - is this the last record? true
2017-06-07 09:21:46 INFO GenQueryProcessor:125 - auto closing result set
2017-06-07 09:21:46 INFO GenQueryProcessor:156 - getting more results for query
2017-06-07 09:21:46 INFO GenQueryProcessor:162 - no results to close, ignore
2017-06-07 09:21:46 INFO UserAOHelper:129 - user built:User:
id:10019 name:ajongejan
userType:rodsuser
userDn:
zone:tempZone
info:
comment:
2017-06-07 09:21:46 INFO UserAOHelper:129 - user built:User:
id:10022 name:bdvanschaik
userType:rodsuser
userDn:
zone:tempZone
info:
comment:
2017-06-07 09:21:46 INFO UserAOHelper:129 - user built:User:
id:10010 name:ds-immuno
userType:rodsadmin
userDn:
zone:tempZone
info:
comment:
2017-06-07 09:21:46 INFO UserAOHelper:129 - user built:User:
id:10007 name:ds-repmed
userType:rodsadmin
userDn:
zone:tempZone
info:
comment:
2017-06-07 09:21:46 INFO UserAOHelper:129 - user built:User:
id:35404 name:felipe
userType:rodsuser
userDn:
zone:tempZone
info:
comment:
2017-06-07 09:21:46 INFO UserAOHelper:129 - user built:User:
id:10025 name:foliveiragutierrez
userType:rodsuser
userDn:
zone:tempZone
info:
comment:
2017-06-07 09:21:46 INFO UserAOHelper:129 - user built:User:
id:10037 name:gp-immuno
userType:rodsgroup
userDn:
zone:tempZone
info:
comment:
2017-06-07 09:21:46 INFO UserAOHelper:129 - user built:User:
id:10034 name:gp-repmed
userType:rodsgroup
userDn:
zone:tempZone
info:
comment:
2017-06-07 09:21:46 INFO UserAOHelper:129 - user built:User:
id:15782 name:gp-test
userType:rodsgroup
userDn:
zone:tempZone
info:
comment:
2017-06-07 09:21:46 INFO UserAOHelper:129 - user built:User:
id:10028 name:pfdegeest
userType:rodsuser
userDn:
zone:tempZone
info:
comment:
2017-06-07 09:21:46 INFO UserAOHelper:129 - user built:User:
id:10004 name:pi-immuno
userType:rodsadmin
userDn:
zone:tempZone
info:
comment:
2017-06-07 09:21:46 INFO UserAOHelper:129 - user built:User:
id:10001 name:pi-repmed
userType:rodsadmin
userDn:
zone:tempZone
info:
comment:
2017-06-07 09:21:46 INFO UserAOHelper:129 - user built:User:
id:9002 name:public
userType:rodsgroup
userDn:
zone:tempZone
info:
comment:
2017-06-07 09:21:46 INFO UserAOHelper:129 - user built:User:
id:9010 name:rods
userType:rodsadmin
userDn:
zone:tempZone
info:
comment:
2017-06-07 09:21:46 INFO UserAOHelper:129 - user built:User:
id:9001 name:rodsadmin
userType:rodsgroup
userDn:
zone:tempZone
info:
comment:
2017-06-07 09:21:46 INFO UserAOHelper:129 - user built:User:
id:10031 name:sdolabarriaga
userType:rodsuser
userDn:
zone:tempZone
info:
comment:
2017-06-07 09:21:46 INFO UserAOHelper:129 - user built:User:
id:10016 name:ugp-immuno
userType:rodsuser
userDn:
zone:tempZone
info:
comment:
2017-06-07 09:21:46 INFO UserAOHelper:129 - user built:User:
id:10013 name:ugp-repmed
userType:rodsuser
userDn:
zone:tempZone
info:
comment:
2017-06-07 09:21:46 INFO UserAOHelper:129 - user built:User:
id:15785 name:ugp-test
userType:rodsuser
userDn:
zone:tempZone
info:
comment:
2017-06-07 09:21:46 DEBUG HibernateTransactionManager:367 - Creating new transaction with name [com.emc.metalnx.core.domain.dao.impl.GroupDaoImpl.findAll]: PROPAGATION_REQUIRED,ISOLATION_DEFAULT; ''
2017-06-07 09:21:46 DEBUG SessionImpl:312 - Opened session at timestamp: 14968417064
2017-06-07 09:21:46 DEBUG HibernateTransactionManager:420 - Opened new Session [SessionImpl(PersistenceContext[entityKeys=[],collectionKeys=[]];ActionQueue[insertions=[] updates=[] deletions=[] collectionCreations=[] collectionRemovals=[] collectionUpdates=[] unresolvedInsertDependencies=UnresolvedEntityInsertActions[]])] for Hibernate transaction
2017-06-07 09:21:46 DEBUG HibernateTransactionManager:430 - Preparing JDBC Connection of Hibernate Session [SessionImpl(PersistenceContext[entityKeys=[],collectionKeys=[]];ActionQueue[insertions=[] updates=[] deletions=[] collectionCreations=[] collectionRemovals=[] collectionUpdates=[] unresolvedInsertDependencies=UnresolvedEntityInsertActions[]])]
2017-06-07 09:21:46 DEBUG AbstractTransactionImpl:158 - begin
2017-06-07 09:21:46 DEBUG LogicalConnectionImpl:295 - Obtaining JDBC connection
2017-06-07 09:21:46 DEBUG DriverManagerDataSource:142 - Creating new JDBC DriverManager Connection to [jdbc:mysql://127.0.0.1:3306/metalnx]
2017-06-07 09:21:46 DEBUG LogicalConnectionImpl:301 - Obtained JDBC connection
2017-06-07 09:21:46 DEBUG JdbcTransaction:69 - initial autocommit status: true
2017-06-07 09:21:46 DEBUG JdbcTransaction:71 - disabling autocommit
2017-06-07 09:21:46 DEBUG HibernateTransactionManager:491 - Exposing Hibernate transaction as JDBC transaction [org.hibernate.engine.jdbc.internal.proxy.ConnectionProxyHandler@54e023d4[valid=true]]
2017-06-07 09:21:46 DEBUG SQL:104 - select datagridgr0_.id as id0_, datagridgr0_.additional_info as additional2_0_, datagridgr0_.data_grid_id as data3_0_, datagridgr0_.groupname as groupname0_ from groups datagridgr0_
Hibernate: select datagridgr0_.id as id0_, datagridgr0_.additional_info as additional2_0_, datagridgr0_.data_grid_id as data3_0_, datagridgr0_.groupname as groupname0_ from groups datagridgr0_
2017-06-07 09:21:46 DEBUG Loader:853 - Result set row: 0
2017-06-07 09:21:46 DEBUG Loader:1348 - Result row: EntityKey[com.emc.metalnx.core.domain.entity.DataGridGroup#2]
2017-06-07 09:21:46 DEBUG Loader:853 - Result set row: 1
2017-06-07 09:21:46 DEBUG Loader:1348 - Result row: EntityKey[com.emc.metalnx.core.domain.entity.DataGridGroup#4]
2017-06-07 09:21:46 DEBUG Loader:853 - Result set row: 2
2017-06-07 09:21:46 DEBUG Loader:1348 - Result row: EntityKey[com.emc.metalnx.core.domain.entity.DataGridGroup#5]
2017-06-07 09:21:46 DEBUG Loader:853 - Result set row: 3
2017-06-07 09:21:46 DEBUG Loader:1348 - Result row: EntityKey[com.emc.metalnx.core.domain.entity.DataGridGroup#8]
2017-06-07 09:21:46 DEBUG Loader:853 - Result set row: 4
2017-06-07 09:21:46 DEBUG Loader:1348 - Result row: EntityKey[com.emc.metalnx.core.domain.entity.DataGridGroup#9]
2017-06-07 09:21:46 DEBUG TwoPhaseLoad:158 - Resolving associations for [com.emc.metalnx.core.domain.entity.DataGridGroup#2]
2017-06-07 09:21:46 DEBUG TwoPhaseLoad:297 - Done materializing entity [com.emc.metalnx.core.domain.entity.DataGridGroup#2]
2017-06-07 09:21:46 DEBUG TwoPhaseLoad:158 - Resolving associations for [com.emc.metalnx.core.domain.entity.DataGridGroup#4]
2017-06-07 09:21:46 DEBUG TwoPhaseLoad:297 - Done materializing entity [com.emc.metalnx.core.domain.entity.DataGridGroup#4]
2017-06-07 09:21:46 DEBUG TwoPhaseLoad:158 - Resolving associations for [com.emc.metalnx.core.domain.entity.DataGridGroup#5]
2017-06-07 09:21:46 DEBUG TwoPhaseLoad:297 - Done materializing entity [com.emc.metalnx.core.domain.entity.DataGridGroup#5]
2017-06-07 09:21:46 DEBUG TwoPhaseLoad:158 - Resolving associations for [com.emc.metalnx.core.domain.entity.DataGridGroup#8]
2017-06-07 09:21:46 DEBUG TwoPhaseLoad:297 - Done materializing entity [com.emc.metalnx.core.domain.entity.DataGridGroup#8]
2017-06-07 09:21:46 DEBUG TwoPhaseLoad:158 - Resolving associations for [com.emc.metalnx.core.domain.entity.DataGridGroup#9]
2017-06-07 09:21:46 DEBUG TwoPhaseLoad:297 - Done materializing entity [com.emc.metalnx.core.domain.entity.DataGridGroup#9]
2017-06-07 09:21:46 DEBUG StatefulPersistenceContext:1007 - Initializing non-lazy collections
2017-06-07 09:21:46 DEBUG Loader:2089 - Loading collection: [com.emc.metalnx.core.domain.entity.DataGridGroup.userProfiles#9]
2017-06-07 09:21:46 DEBUG SQL:104 - select userprofil0_.group_id as group2_0_1_, userprofil0_.profile_id as profile1_9_1_, userprofil1_.id as id8_0_, userprofil1_.description as descript2_8_0_, userprofil1_.profile_name as profile3_8_0_ from user_profile_groups userprofil0_ inner join user_profile userprofil1_ on userprofil0_.profile_id=userprofil1_.id where userprofil0_.group_id=?
Hibernate: select userprofil0_.group_id as group2_0_1_, userprofil0_.profile_id as profile1_9_1_, userprofil1_.id as id8_0_, userprofil1_.description as descript2_8_0_, userprofil1_.profile_name as profile3_8_0_ from user_profile_groups userprofil0_ inner join user_profile userprofil1_ on userprofil0_.profile_id=userprofil1_.id where userprofil0_.group_id=?
2017-06-07 09:21:46 DEBUG Loader:1234 - Result set contains (possibly empty) collection: [com.emc.metalnx.core.domain.entity.DataGridGroup.userProfiles#9]
2017-06-07 09:21:46 DEBUG CollectionLoadContext:229 - 1 collections were found in result set for role: com.emc.metalnx.core.domain.entity.DataGridGroup.userProfiles
2017-06-07 09:21:46 DEBUG CollectionLoadContext:266 - Collection fully initialized: [com.emc.metalnx.core.domain.entity.DataGridGroup.userProfiles#9]
2017-06-07 09:21:46 DEBUG CollectionLoadContext:236 - 1 collections initialized for role: com.emc.metalnx.core.domain.entity.DataGridGroup.userProfiles
2017-06-07 09:21:46 DEBUG Loader:2109 - Done loading collection
2017-06-07 09:21:46 DEBUG Loader:2089 - Loading collection: [com.emc.metalnx.core.domain.entity.DataGridGroup.groupBookmarks#9]
2017-06-07 09:21:46 DEBUG SQL:104 - select groupbookm0_.group_id as group6_0_1_, groupbookm0_.id as id1_1_, groupbookm0_.id as id1_0_, groupbookm0_.created_at as created2_1_0_, groupbookm0_.group_id as group6_1_0_, groupbookm0_.is_collection as is3_1_0_, groupbookm0_.is_notified as is4_1_0_, groupbookm0_.path as path1_0_ from group_bookmarks groupbookm0_ where groupbookm0_.group_id=?
Hibernate: select groupbookm0_.group_id as group6_0_1_, groupbookm0_.id as id1_1_, groupbookm0_.id as id1_0_, groupbookm0_.created_at as created2_1_0_, groupbookm0_.group_id as group6_1_0_, groupbookm0_.is_collection as is3_1_0_, groupbookm0_.is_notified as is4_1_0_, groupbookm0_.path as path1_0_ from group_bookmarks groupbookm0_ where groupbookm0_.group_id=?
2017-06-07 09:21:46 DEBUG Loader:1234 - Result set contains (possibly empty) collection: [com.emc.metalnx.core.domain.entity.DataGridGroup.groupBookmarks#9]
2017-06-07 09:21:46 DEBUG CollectionLoadContext:229 - 1 collections were found in result set for role: com.emc.metalnx.core.domain.entity.DataGridGroup.groupBookmarks
2017-06-07 09:21:46 DEBUG CollectionLoadContext:266 - Collection fully initialized: [com.emc.metalnx.core.domain.entity.DataGridGroup.groupBookmarks#9]
2017-06-07 09:21:46 DEBUG CollectionLoadContext:236 - 1 collections initialized for role: com.emc.metalnx.core.domain.entity.DataGridGroup.groupBookmarks
2017-06-07 09:21:46 DEBUG Loader:2109 - Done loading collection
2017-06-07 09:21:46 DEBUG Loader:2089 - Loading collection: [com.emc.metalnx.core.domain.entity.DataGridGroup.userProfiles#8]
2017-06-07 09:21:46 DEBUG SQL:104 - select userprofil0_.group_id as group2_0_1_, userprofil0_.profile_id as profile1_9_1_, userprofil1_.id as id8_0_, userprofil1_.description as descript2_8_0_, userprofil1_.profile_name as profile3_8_0_ from user_profile_groups userprofil0_ inner join user_profile userprofil1_ on userprofil0_.profile_id=userprofil1_.id where userprofil0_.group_id=?
Hibernate: select userprofil0_.group_id as group2_0_1_, userprofil0_.profile_id as profile1_9_1_, userprofil1_.id as id8_0_, userprofil1_.description as descript2_8_0_, userprofil1_.profile_name as profile3_8_0_ from user_profile_groups userprofil0_ inner join user_profile userprofil1_ on userprofil0_.profile_id=userprofil1_.id where userprofil0_.group_id=?
2017-06-07 09:21:46 DEBUG Loader:1234 - Result set contains (possibly empty) collection: [com.emc.metalnx.core.domain.entity.DataGridGroup.userProfiles#8]
2017-06-07 09:21:46 DEBUG CollectionLoadContext:229 - 1 collections were found in result set for role: com.emc.metalnx.core.domain.entity.DataGridGroup.userProfiles
2017-06-07 09:21:46 DEBUG CollectionLoadContext:266 - Collection fully initialized: [com.emc.metalnx.core.domain.entity.DataGridGroup.userProfiles#8]
2017-06-07 09:21:46 DEBUG CollectionLoadContext:236 - 1 collections initialized for role: com.emc.metalnx.core.domain.entity.DataGridGroup.userProfiles
2017-06-07 09:21:46 DEBUG Loader:2109 - Done loading collection
2017-06-07 09:21:46 DEBUG Loader:2089 - Loading collection: [com.emc.metalnx.core.domain.entity.DataGridGroup.groupBookmarks#8]
2017-06-07 09:21:46 DEBUG SQL:104 - select groupbookm0_.group_id as group6_0_1_, groupbookm0_.id as id1_1_, groupbookm0_.id as id1_0_, groupbookm0_.created_at as created2_1_0_, groupbookm0_.group_id as group6_1_0_, groupbookm0_.is_collection as is3_1_0_, groupbookm0_.is_notified as is4_1_0_, groupbookm0_.path as path1_0_ from group_bookmarks groupbookm0_ where groupbookm0_.group_id=?
Hibernate: select groupbookm0_.group_id as group6_0_1_, groupbookm0_.id as id1_1_, groupbookm0_.id as id1_0_, groupbookm0_.created_at as created2_1_0_, groupbookm0_.group_id as group6_1_0_, groupbookm0_.is_collection as is3_1_0_, groupbookm0_.is_notified as is4_1_0_, groupbookm0_.path as path1_0_ from group_bookmarks groupbookm0_ where groupbookm0_.group_id=?
2017-06-07 09:21:46 DEBUG Loader:1234 - Result set contains (possibly empty) collection: [com.emc.metalnx.core.domain.entity.DataGridGroup.groupBookmarks#8]
2017-06-07 09:21:46 DEBUG CollectionLoadContext:229 - 1 collections were found in result set for role: com.emc.metalnx.core.domain.entity.DataGridGroup.groupBookmarks
2017-06-07 09:21:46 DEBUG CollectionLoadContext:266 - Collection fully initialized: [com.emc.metalnx.core.domain.entity.DataGridGroup.groupBookmarks#8]
2017-06-07 09:21:46 DEBUG CollectionLoadContext:236 - 1 collections initialized for role: com.emc.metalnx.core.domain.entity.DataGridGroup.groupBookmarks
2017-06-07 09:21:46 DEBUG Loader:2109 - Done loading collection
2017-06-07 09:21:46 DEBUG Loader:2089 - Loading collection: [com.emc.metalnx.core.domain.entity.DataGridGroup.userProfiles#5]
2017-06-07 09:21:46 DEBUG SQL:104 - select userprofil0_.group_id as group2_0_1_, userprofil0_.profile_id as profile1_9_1_, userprofil1_.id as id8_0_, userprofil1_.description as descript2_8_0_, userprofil1_.profile_name as profile3_8_0_ from user_profile_groups userprofil0_ inner join user_profile userprofil1_ on userprofil0_.profile_id=userprofil1_.id where userprofil0_.group_id=?
Hibernate: select userprofil0_.group_id as group2_0_1_, userprofil0_.profile_id as profile1_9_1_, userprofil1_.id as id8_0_, userprofil1_.description as descript2_8_0_, userprofil1_.profile_name as profile3_8_0_ from user_profile_groups userprofil0_ inner join user_profile userprofil1_ on userprofil0_.profile_id=userprofil1_.id where userprofil0_.group_id=?
2017-06-07 09:21:46 DEBUG Loader:1234 - Result set contains (possibly empty) collection: [com.emc.metalnx.core.domain.entity.DataGridGroup.userProfiles#5]
2017-06-07 09:21:46 DEBUG CollectionLoadContext:229 - 1 collections were found in result set for role: com.emc.metalnx.core.domain.entity.DataGridGroup.userProfiles
2017-06-07 09:21:46 DEBUG CollectionLoadContext:266 - Collection fully initialized: [com.emc.metalnx.core.domain.entity.DataGridGroup.userProfiles#5]
2017-06-07 09:21:46 DEBUG CollectionLoadContext:236 - 1 collections initialized for role: com.emc.metalnx.core.domain.entity.DataGridGroup.userProfiles
2017-06-07 09:21:46 DEBUG Loader:2109 - Done loading collection
2017-06-07 09:21:46 DEBUG Loader:2089 - Loading collection: [com.emc.metalnx.core.domain.entity.DataGridGroup.groupBookmarks#5]
2017-06-07 09:21:46 DEBUG SQL:104 - select groupbookm0_.group_id as group6_0_1_, groupbookm0_.id as id1_1_, groupbookm0_.id as id1_0_, groupbookm0_.created_at as created2_1_0_, groupbookm0_.group_id as group6_1_0_, groupbookm0_.is_collection as is3_1_0_, groupbookm0_.is_notified as is4_1_0_, groupbookm0_.path as path1_0_ from group_bookmarks groupbookm0_ where groupbookm0_.group_id=?
Hibernate: select groupbookm0_.group_id as group6_0_1_, groupbookm0_.id as id1_1_, groupbookm0_.id as id1_0_, groupbookm0_.created_at as created2_1_0_, groupbookm0_.group_id as group6_1_0_, groupbookm0_.is_collection as is3_1_0_, groupbookm0_.is_notified as is4_1_0_, groupbookm0_.path as path1_0_ from group_bookmarks groupbookm0_ where groupbookm0_.group_id=?
2017-06-07 09:21:46 DEBUG Loader:1234 - Result set contains (possibly empty) collection: [com.emc.metalnx.core.domain.entity.DataGridGroup.groupBookmarks#5]
2017-06-07 09:21:46 DEBUG CollectionLoadContext:229 - 1 collections were found in result set for role: com.emc.metalnx.core.domain.entity.DataGridGroup.groupBookmarks
2017-06-07 09:21:46 DEBUG CollectionLoadContext:266 - Collection fully initialized: [com.emc.metalnx.core.domain.entity.DataGridGroup.groupBookmarks#5]
2017-06-07 09:21:46 DEBUG CollectionLoadContext:236 - 1 collections initialized for role: com.emc.metalnx.core.domain.entity.DataGridGroup.groupBookmarks
2017-06-07 09:21:46 DEBUG Loader:2109 - Done loading collection
2017-06-07 09:21:46 DEBUG Loader:2089 - Loading collection: [com.emc.metalnx.core.domain.entity.DataGridGroup.userProfiles#4]
2017-06-07 09:21:46 DEBUG SQL:104 - select userprofil0_.group_id as group2_0_1_, userprofil0_.profile_id as profile1_9_1_, userprofil1_.id as id8_0_, userprofil1_.description as descript2_8_0_, userprofil1_.profile_name as profile3_8_0_ from user_profile_groups userprofil0_ inner join user_profile userprofil1_ on userprofil0_.profile_id=userprofil1_.id where userprofil0_.group_id=?
Hibernate: select userprofil0_.group_id as group2_0_1_, userprofil0_.profile_id as profile1_9_1_, userprofil1_.id as id8_0_, userprofil1_.description as descript2_8_0_, userprofil1_.profile_name as profile3_8_0_ from user_profile_groups userprofil0_ inner join user_profile userprofil1_ on userprofil0_.profile_id=userprofil1_.id where userprofil0_.group_id=?
2017-06-07 09:21:46 DEBUG Loader:1234 - Result set contains (possibly empty) collection: [com.emc.metalnx.core.domain.entity.DataGridGroup.userProfiles#4]
2017-06-07 09:21:46 DEBUG CollectionLoadContext:229 - 1 collections were found in result set for role: com.emc.metalnx.core.domain.entity.DataGridGroup.userProfiles
2017-06-07 09:21:46 DEBUG CollectionLoadContext:266 - Collection fully initialized: [com.emc.metalnx.core.domain.entity.DataGridGroup.userProfiles#4]
2017-06-07 09:21:46 DEBUG CollectionLoadContext:236 - 1 collections initialized for role: com.emc.metalnx.core.domain.entity.DataGridGroup.userProfiles
2017-06-07 09:21:46 DEBUG Loader:2109 - Done loading collection
2017-06-07 09:21:46 DEBUG Loader:2089 - Loading collection: [com.emc.metalnx.core.domain.entity.DataGridGroup.groupBookmarks#4]
2017-06-07 09:21:46 DEBUG SQL:104 - select groupbookm0_.group_id as group6_0_1_, groupbookm0_.id as id1_1_, groupbookm0_.id as id1_0_, groupbookm0_.created_at as created2_1_0_, groupbookm0_.group_id as group6_1_0_, groupbookm0_.is_collection as is3_1_0_, groupbookm0_.is_notified as is4_1_0_, groupbookm0_.path as path1_0_ from group_bookmarks groupbookm0_ where groupbookm0_.group_id=?
Hibernate: select groupbookm0_.group_id as group6_0_1_, groupbookm0_.id as id1_1_, groupbookm0_.id as id1_0_, groupbookm0_.created_at as created2_1_0_, groupbookm0_.group_id as group6_1_0_, groupbookm0_.is_collection as is3_1_0_, groupbookm0_.is_notified as is4_1_0_, groupbookm0_.path as path1_0_ from group_bookmarks groupbookm0_ where groupbookm0_.group_id=?
2017-06-07 09:21:46 DEBUG Loader:1234 - Result set contains (possibly empty) collection: [com.emc.metalnx.core.domain.entity.DataGridGroup.groupBookmarks#4]
2017-06-07 09:21:46 DEBUG CollectionLoadContext:229 - 1 collections were found in result set for role: com.emc.metalnx.core.domain.entity.DataGridGroup.groupBookmarks
2017-06-07 09:21:46 DEBUG CollectionLoadContext:266 - Collection fully initialized: [com.emc.metalnx.core.domain.entity.DataGridGroup.groupBookmarks#4]
2017-06-07 09:21:46 DEBUG CollectionLoadContext:236 - 1 collections initialized for role: com.emc.metalnx.core.domain.entity.DataGridGroup.groupBookmarks
2017-06-07 09:21:46 DEBUG Loader:2109 - Done loading collection
2017-06-07 09:21:46 DEBUG Loader:2089 - Loading collection: [com.emc.metalnx.core.domain.entity.DataGridGroup.userProfiles#2]
2017-06-07 09:21:46 DEBUG SQL:104 - select userprofil0_.group_id as group2_0_1_, userprofil0_.profile_id as profile1_9_1_, userprofil1_.id as id8_0_, userprofil1_.description as descript2_8_0_, userprofil1_.profile_name as profile3_8_0_ from user_profile_groups userprofil0_ inner join user_profile userprofil1_ on userprofil0_.profile_id=userprofil1_.id where userprofil0_.group_id=?
Hibernate: select userprofil0_.group_id as group2_0_1_, userprofil0_.profile_id as profile1_9_1_, userprofil1_.id as id8_0_, userprofil1_.description as descript2_8_0_, userprofil1_.profile_name as profile3_8_0_ from user_profile_groups userprofil0_ inner join user_profile userprofil1_ on userprofil0_.profile_id=userprofil1_.id where userprofil0_.group_id=?
2017-06-07 09:21:46 DEBUG Loader:1234 - Result set contains (possibly empty) collection: [com.emc.metalnx.core.domain.entity.DataGridGroup.userProfiles#2]
2017-06-07 09:21:46 DEBUG CollectionLoadContext:229 - 1 collections were found in result set for role: com.emc.metalnx.core.domain.entity.DataGridGroup.userProfiles
2017-06-07 09:21:46 DEBUG CollectionLoadContext:266 - Collection fully initialized: [com.emc.metalnx.core.domain.entity.DataGridGroup.userProfiles#2]
2017-06-07 09:21:46 DEBUG CollectionLoadContext:236 - 1 collections initialized for role: com.emc.metalnx.core.domain.entity.DataGridGroup.userProfiles
2017-06-07 09:21:46 DEBUG Loader:2109 - Done loading collection
2017-06-07 09:21:46 DEBUG Loader:2089 - Loading collection: [com.emc.metalnx.core.domain.entity.DataGridGroup.groupBookmarks#2]
2017-06-07 09:21:46 DEBUG SQL:104 - select groupbookm0_.group_id as group6_0_1_, groupbookm0_.id as id1_1_, groupbookm0_.id as id1_0_, groupbookm0_.created_at as created2_1_0_, groupbookm0_.group_id as group6_1_0_, groupbookm0_.is_collection as is3_1_0_, groupbookm0_.is_notified as is4_1_0_, groupbookm0_.path as path1_0_ from group_bookmarks groupbookm0_ where groupbookm0_.group_id=?
Hibernate: select groupbookm0_.group_id as group6_0_1_, groupbookm0_.id as id1_1_, groupbookm0_.id as id1_0_, groupbookm0_.created_at as created2_1_0_, groupbookm0_.group_id as group6_1_0_, groupbookm0_.is_collection as is3_1_0_, groupbookm0_.is_notified as is4_1_0_, groupbookm0_.path as path1_0_ from group_bookmarks groupbookm0_ where groupbookm0_.group_id=?
2017-06-07 09:21:46 DEBUG Loader:1234 - Result set contains (possibly empty) collection: [com.emc.metalnx.core.domain.entity.DataGridGroup.groupBookmarks#2]
2017-06-07 09:21:46 DEBUG CollectionLoadContext:229 - 1 collections were found in result set for role: com.emc.metalnx.core.domain.entity.DataGridGroup.groupBookmarks
2017-06-07 09:21:46 DEBUG CollectionLoadContext:266 - Collection fully initialized: [com.emc.metalnx.core.domain.entity.DataGridGroup.groupBookmarks#2]
2017-06-07 09:21:46 DEBUG CollectionLoadContext:236 - 1 collections initialized for role: com.emc.metalnx.core.domain.entity.DataGridGroup.groupBookmarks
2017-06-07 09:21:46 DEBUG Loader:2109 - Done loading collection
2017-06-07 09:21:46 DEBUG HibernateTransactionManager:755 - Initiating transaction commit
2017-06-07 09:21:46 DEBUG HibernateTransactionManager:554 - Committing Hibernate transaction on Session [SessionImpl(PersistenceContext[entityKeys=[EntityKey[com.emc.metalnx.core.domain.entity.DataGridGroup#9], EntityKey[com.emc.metalnx.core.domain.entity.DataGridGroup#2], EntityKey[com.emc.metalnx.core.domain.entity.DataGridGroup#8], EntityKey[com.emc.metalnx.core.domain.entity.DataGridGroup#5], EntityKey[com.emc.metalnx.core.domain.entity.DataGridGroup#4]],collectionKeys=[CollectionKey[com.emc.metalnx.core.domain.entity.DataGridGroup.userProfiles#9], CollectionKey[com.emc.metalnx.core.domain.entity.DataGridGroup.groupBookmarks#4], CollectionKey[com.emc.metalnx.core.domain.entity.DataGridGroup.userProfiles#8], CollectionKey[com.emc.metalnx.core.domain.entity.DataGridGroup.groupBookmarks#5], CollectionKey[com.emc.metalnx.core.domain.entity.DataGridGroup.userProfiles#5], CollectionKey[com.emc.metalnx.core.domain.entity.DataGridGroup.userProfiles#4], CollectionKey[com.emc.metalnx.core.domain.entity.DataGridGroup.groupBookmarks#2], CollectionKey[com.emc.metalnx.core.domain.entity.DataGridGroup.userProfiles#2], CollectionKey[com.emc.metalnx.core.domain.entity.DataGridGroup.groupBookmarks#8], CollectionKey[com.emc.metalnx.core.domain.entity.DataGridGroup.groupBookmarks#9]]];ActionQueue[insertions=[] updates=[] deletions=[] collectionCreations=[] collectionRemovals=[] collectionUpdates=[] unresolvedInsertDependencies=UnresolvedEntityInsertActions[]])]
2017-06-07 09:21:46 DEBUG AbstractTransactionImpl:173 - committing
2017-06-07 09:21:46 DEBUG AbstractFlushingEventListener:143 - Processing flush-time cascades
2017-06-07 09:21:46 DEBUG AbstractFlushingEventListener:183 - Dirty checking collections
2017-06-07 09:21:46 DEBUG Collections:191 - Collection found: [com.emc.metalnx.core.domain.entity.DataGridGroup.groupBookmarks#2], was: [com.emc.metalnx.core.domain.entity.DataGridGroup.groupBookmarks#2] (initialized)
2017-06-07 09:21:46 DEBUG Collections:191 - Collection found: [com.emc.metalnx.core.domain.entity.DataGridGroup.userProfiles#2], was: [com.emc.metalnx.core.domain.entity.DataGridGroup.userProfiles#2] (initialized)
2017-06-07 09:21:46 DEBUG Collections:191 - Collection found: [com.emc.metalnx.core.domain.entity.DataGridGroup.groupBookmarks#4], was: [com.emc.metalnx.core.domain.entity.DataGridGroup.groupBookmarks#4] (initialized)
2017-06-07 09:21:46 DEBUG Collections:191 - Collection found: [com.emc.metalnx.core.domain.entity.DataGridGroup.userProfiles#4], was: [com.emc.metalnx.core.domain.entity.DataGridGroup.userProfiles#4] (initialized)
2017-06-07 09:21:46 DEBUG Collections:191 - Collection found: [com.emc.metalnx.core.domain.entity.DataGridGroup.groupBookmarks#5], was: [com.emc.metalnx.core.domain.entity.DataGridGroup.groupBookmarks#5] (initialized)
2017-06-07 09:21:46 DEBUG Collections:191 - Collection found: [com.emc.metalnx.core.domain.entity.DataGridGroup.userProfiles#5], was: [com.emc.metalnx.core.domain.entity.DataGridGroup.userProfiles#5] (initialized)
2017-06-07 09:21:46 DEBUG Collections:191 - Collection found: [com.emc.metalnx.core.domain.entity.DataGridGroup.groupBookmarks#8], was: [com.emc.metalnx.core.domain.entity.DataGridGroup.groupBookmarks#8] (initialized)
2017-06-07 09:21:46 DEBUG Collections:191 - Collection found: [com.emc.metalnx.core.domain.entity.DataGridGroup.userProfiles#8], was: [com.emc.metalnx.core.domain.entity.DataGridGroup.userProfiles#8] (initialized)
2017-06-07 09:21:46 DEBUG Collections:191 - Collection found: [com.emc.metalnx.core.domain.entity.DataGridGroup.groupBookmarks#9], was: [com.emc.metalnx.core.domain.entity.DataGridGroup.groupBookmarks#9] (initialized)
2017-06-07 09:21:46 DEBUG Collections:191 - Collection found: [com.emc.metalnx.core.domain.entity.DataGridGroup.userProfiles#9], was: [com.emc.metalnx.core.domain.entity.DataGridGroup.userProfiles#9] (initialized)
2017-06-07 09:21:46 DEBUG AbstractFlushingEventListener:117 - Flushed: 0 insertions, 0 updates, 0 deletions to 5 objects
2017-06-07 09:21:46 DEBUG AbstractFlushingEventListener:124 - Flushed: 0 (re)creations, 0 updates, 0 removals to 10 collections
2017-06-07 09:21:46 DEBUG EntityPrinter:114 - Listing entities:
2017-06-07 09:21:46 DEBUG EntityPrinter:121 - com.emc.metalnx.core.domain.entity.DataGridGroup{additional_info=tempZone, userProfiles=[], dataGridId=15782, id=9, groupBookmarks=[], groupname=gp-test}
2017-06-07 09:21:46 DEBUG EntityPrinter:121 - com.emc.metalnx.core.domain.entity.DataGridGroup{additional_info=tempZone, userProfiles=[], dataGridId=10037, id=2, groupBookmarks=[], groupname=gp-immuno}
2017-06-07 09:21:46 DEBUG EntityPrinter:121 - com.emc.metalnx.core.domain.entity.DataGridGroup{additional_info=tempZone, userProfiles=[], dataGridId=10034, id=8, groupBookmarks=[], groupname=gp-repmed}
2017-06-07 09:21:46 DEBUG EntityPrinter:121 - com.emc.metalnx.core.domain.entity.DataGridGroup{additional_info=tempZone, userProfiles=[], dataGridId=9002, id=5, groupBookmarks=[], groupname=public}
2017-06-07 09:21:46 DEBUG EntityPrinter:121 - com.emc.metalnx.core.domain.entity.DataGridGroup{additional_info=tempZone, userProfiles=[], dataGridId=9001, id=4, groupBookmarks=[], groupname=rodsadmin}
2017-06-07 09:21:46 DEBUG JdbcTransaction:113 - committed JDBC Connection
2017-06-07 09:21:46 DEBUG JdbcTransaction:126 - re-enabling autocommit
2017-06-07 09:21:46 DEBUG HibernateTransactionManager:636 - Closing Hibernate Session [SessionImpl(PersistenceContext[entityKeys=[EntityKey[com.emc.metalnx.core.domain.entity.DataGridGroup#9], EntityKey[com.emc.metalnx.core.domain.entity.DataGridGroup#2], EntityKey[com.emc.metalnx.core.domain.entity.DataGridGroup#8], EntityKey[com.emc.metalnx.core.domain.entity.DataGridGroup#5], EntityKey[com.emc.metalnx.core.domain.entity.DataGridGroup#4]],collectionKeys=[CollectionKey[com.emc.metalnx.core.domain.entity.DataGridGroup.userProfiles#9], CollectionKey[com.emc.metalnx.core.domain.entity.DataGridGroup.groupBookmarks#4], CollectionKey[com.emc.metalnx.core.domain.entity.DataGridGroup.userProfiles#8], CollectionKey[com.emc.metalnx.core.domain.entity.DataGridGroup.groupBookmarks#5], CollectionKey[com.emc.metalnx.core.domain.entity.DataGridGroup.userProfiles#5], CollectionKey[com.emc.metalnx.core.domain.entity.DataGridGroup.userProfiles#4], CollectionKey[com.emc.metalnx.core.domain.entity.DataGridGroup.groupBookmarks#2], CollectionKey[com.emc.metalnx.core.domain.entity.DataGridGroup.userProfiles#2], CollectionKey[com.emc.metalnx.core.domain.entity.DataGridGroup.groupBookmarks#8], CollectionKey[com.emc.metalnx.core.domain.entity.DataGridGroup.groupBookmarks#9]]];ActionQueue[insertions=[] updates=[] deletions=[] collectionCreations=[] collectionRemovals=[] collectionUpdates=[] unresolvedInsertDependencies=UnresolvedEntityInsertActions[]])] after transaction
2017-06-07 09:21:46 DEBUG LogicalConnectionImpl:314 - Releasing JDBC connection
2017-06-07 09:21:46 DEBUG LogicalConnectionImpl:332 - Released JDBC connection
2017-06-07 09:21:46 DEBUG ConnectionProxyHandler:219 - HHH000163: Logical connection releasing its physical connection
2017-06-07 09:21:46 DEBUG ConnectionProxyHandler:219 - HHH000163: Logical connection releasing its physical connection
2017-06-07 09:21:46 DEBUG ConnectionProxyHandler:219 - HHH000163: Logical connection releasing its physical connection
2017-06-07 09:21:46 DEBUG ConnectionProxyHandler:219 - HHH000163: Logical connection releasing its physical connection
```
Sign up for free to join this conversation on GitHub. Already have an account? Sign in to comment