[INFO]
[INFO] ------------------------------------------------------------------------
[INFO] Building org.cumulus4j.keystore 1.2.1-SNAPSHOT
[INFO] ------------------------------------------------------------------------
[INFO]
[INFO] --- maven-clean-plugin:2.4.1:clean (default-clean) @ org.cumulus4j.keystore ---
[INFO] Deleting /home/tomcat/.jenkins/workspace/org.cumulus4j/org.cumulus4j/org.cumulus4j.keystore (includes = [*.log, $jarplug.work/**], excludes = [])
[INFO]
[INFO] --- maven-resources-plugin:2.5:resources (default-resources) @ org.cumulus4j.keystore ---
[debug] execute contextualize
[INFO] Using 'UTF-8' encoding to copy filtered resources.
[INFO] skip non existing resourceDirectory /home/tomcat/.jenkins/workspace/org.cumulus4j/org.cumulus4j/org.cumulus4j.keystore/src/main/resources
[INFO] Copying 1 resource
[INFO] Copying 0 resource
[INFO]
[INFO] --- maven-compiler-plugin:2.3.2:compile (default-compile) @ org.cumulus4j.keystore ---
[INFO] Compiling 27 source files to /home/tomcat/.jenkins/workspace/org.cumulus4j/org.cumulus4j/org.cumulus4j.keystore/target/classes
[INFO]
[INFO] --- maven-resources-plugin:2.5:testResources (default-testResources) @ org.cumulus4j.keystore ---
[debug] execute contextualize
[INFO] Using 'UTF-8' encoding to copy filtered resources.
[INFO] Copying 19 resources
[INFO]
[INFO] --- maven-compiler-plugin:2.3.2:testCompile (default-testCompile) @ org.cumulus4j.keystore ---
[INFO] Compiling 12 source files to /home/tomcat/.jenkins/workspace/org.cumulus4j/org.cumulus4j/org.cumulus4j.keystore/target/test-classes
[INFO]
[INFO] --- maven-surefire-plugin:2.8.1:test (default-test) @ org.cumulus4j.keystore ---
[INFO] Surefire report directory: /home/tomcat/.jenkins/workspace/org.cumulus4j/org.cumulus4j/org.cumulus4j.keystore/target/surefire-reports
-------------------------------------------------------
T E S T S
-------------------------------------------------------
Running org.cumulus4j.keystore.test.KeyStorePropertyTest
14:43:18,520 INFO [main][KeyStore] getKeySize: System property 'cumulus4j.KeyStore.keySize' is not set. Using default key size (256 bit).
14:43:18,523 INFO [main][KeyStore] createUser: Created master-key with a size of 256 bits. This key will not be modified for this key-store anymore.
14:43:18,526 INFO [main][KeyStore] getEncryptionAlgorithm: System property 'cumulus4j.KeyStore.encryptionAlgorithm' is not set. Using default algorithm 'Twofish/GCM/NoPadding'.
14:43:19,540 TRACE [main][CryptoRegistry] registerMACCalculatorFactory: algorithmName="DES" factoryClass="org.cumulus4j.crypto.internal.mac.MACCalculatorFactoryImpl$DES"
14:43:19,540 TRACE [main][CryptoRegistry] registerMACCalculatorFactory: algorithmName="DESMAC" factoryClass="org.cumulus4j.crypto.internal.mac.MACCalculatorFactoryImpl$DES"
14:43:19,543 TRACE [main][CryptoRegistry] registerMACCalculatorFactory: algorithmName="DES64" factoryClass="org.cumulus4j.crypto.internal.mac.MACCalculatorFactoryImpl$DES64"
14:43:19,543 TRACE [main][CryptoRegistry] registerMACCalculatorFactory: algorithmName="DES64MAC" factoryClass="org.cumulus4j.crypto.internal.mac.MACCalculatorFactoryImpl$DES64"
14:43:19,546 TRACE [main][CryptoRegistry] registerMACCalculatorFactory: algorithmName="DES/CFB8" factoryClass="org.cumulus4j.crypto.internal.mac.MACCalculatorFactoryImpl$DESCFB8"
14:43:19,546 TRACE [main][CryptoRegistry] registerMACCalculatorFactory: algorithmName="DESMAC/CFB8" factoryClass="org.cumulus4j.crypto.internal.mac.MACCalculatorFactoryImpl$DESCFB8"
14:43:19,548 TRACE [main][CryptoRegistry] registerMACCalculatorFactory: algorithmName="DESWITHISO9797" factoryClass="org.cumulus4j.crypto.internal.mac.MACCalculatorFactoryImpl$DES9797Alg3"
14:43:19,548 TRACE [main][CryptoRegistry] registerMACCalculatorFactory: algorithmName="DESWITHISO9797MAC" factoryClass="org.cumulus4j.crypto.internal.mac.MACCalculatorFactoryImpl$DES9797Alg3"
14:43:19,549 TRACE [main][CryptoRegistry] registerMACCalculatorFactory: algorithmName="ISO9797ALG3" factoryClass="org.cumulus4j.crypto.internal.mac.MACCalculatorFactoryImpl$DES9797Alg3"
14:43:19,549 TRACE [main][CryptoRegistry] registerMACCalculatorFactory: algorithmName="ISO9797ALG3MAC" factoryClass="org.cumulus4j.crypto.internal.mac.MACCalculatorFactoryImpl$DES9797Alg3"
14:43:19,553 TRACE [main][CryptoRegistry] registerMACCalculatorFactory: algorithmName="ISO9797ALG3WITHISO7816-4PADDING" factoryClass="org.cumulus4j.crypto.internal.mac.MACCalculatorFactoryImpl$DES9797Alg3with7816d4"
14:43:19,553 TRACE [main][CryptoRegistry] registerMACCalculatorFactory: algorithmName="ISO9797ALG3MACWITHISO7816-4PADDING" factoryClass="org.cumulus4j.crypto.internal.mac.MACCalculatorFactoryImpl$DES9797Alg3with7816d4"
14:43:19,556 TRACE [main][CryptoRegistry] registerMACCalculatorFactory: algorithmName="RC2" factoryClass="org.cumulus4j.crypto.internal.mac.MACCalculatorFactoryImpl$RC2"
14:43:19,556 TRACE [main][CryptoRegistry] registerMACCalculatorFactory: algorithmName="RC2MAC" factoryClass="org.cumulus4j.crypto.internal.mac.MACCalculatorFactoryImpl$RC2"
14:43:19,558 TRACE [main][CryptoRegistry] registerMACCalculatorFactory: algorithmName="RC2/CFB8" factoryClass="org.cumulus4j.crypto.internal.mac.MACCalculatorFactoryImpl$RC2CFB8"
14:43:19,558 TRACE [main][CryptoRegistry] registerMACCalculatorFactory: algorithmName="RC2MAC/CFB8" factoryClass="org.cumulus4j.crypto.internal.mac.MACCalculatorFactoryImpl$RC2CFB8"
14:43:19,560 TRACE [main][CryptoRegistry] registerMACCalculatorFactory: algorithmName="GOST28147" factoryClass="org.cumulus4j.crypto.internal.mac.MACCalculatorFactoryImpl$GOST28147"
14:43:19,561 TRACE [main][CryptoRegistry] registerMACCalculatorFactory: algorithmName="GOST28147MAC" factoryClass="org.cumulus4j.crypto.internal.mac.MACCalculatorFactoryImpl$GOST28147"
14:43:19,565 TRACE [main][CryptoRegistry] registerMACCalculatorFactory: algorithmName="OLDHMACSHA384" factoryClass="org.cumulus4j.crypto.internal.mac.MACCalculatorFactoryImpl$OldSHA384"
14:43:19,567 TRACE [main][CryptoRegistry] registerMACCalculatorFactory: algorithmName="OLDHMACSHA512" factoryClass="org.cumulus4j.crypto.internal.mac.MACCalculatorFactoryImpl$OldSHA512"
14:43:19,569 TRACE [main][CryptoRegistry] registerMACCalculatorFactory: algorithmName="HMACMD2" factoryClass="org.cumulus4j.crypto.internal.mac.MACCalculatorFactoryImpl$MD2"
14:43:19,570 TRACE [main][CryptoRegistry] registerMACCalculatorFactory: algorithmName="HMAC-MD2" factoryClass="org.cumulus4j.crypto.internal.mac.MACCalculatorFactoryImpl$MD2"
14:43:19,570 TRACE [main][CryptoRegistry] registerMACCalculatorFactory: algorithmName="HMAC/MD2" factoryClass="org.cumulus4j.crypto.internal.mac.MACCalculatorFactoryImpl$MD2"
14:43:19,572 TRACE [main][CryptoRegistry] registerMACCalculatorFactory: algorithmName="HMACMD4" factoryClass="org.cumulus4j.crypto.internal.mac.MACCalculatorFactoryImpl$MD4"
14:43:19,573 TRACE [main][CryptoRegistry] registerMACCalculatorFactory: algorithmName="HMAC-MD4" factoryClass="org.cumulus4j.crypto.internal.mac.MACCalculatorFactoryImpl$MD4"
14:43:19,573 TRACE [main][CryptoRegistry] registerMACCalculatorFactory: algorithmName="HMAC/MD4" factoryClass="org.cumulus4j.crypto.internal.mac.MACCalculatorFactoryImpl$MD4"
14:43:19,574 TRACE [main][CryptoRegistry] registerMACCalculatorFactory: algorithmName="HMACMD5" factoryClass="org.cumulus4j.crypto.internal.mac.MACCalculatorFactoryImpl$MD5"
14:43:19,574 TRACE [main][CryptoRegistry] registerMACCalculatorFactory: algorithmName="HMAC-MD5" factoryClass="org.cumulus4j.crypto.internal.mac.MACCalculatorFactoryImpl$MD5"
14:43:19,574 TRACE [main][CryptoRegistry] registerMACCalculatorFactory: algorithmName="HMAC/MD5" factoryClass="org.cumulus4j.crypto.internal.mac.MACCalculatorFactoryImpl$MD5"
14:43:19,576 TRACE [main][CryptoRegistry] registerMACCalculatorFactory: algorithmName="HMACSHA1" factoryClass="org.cumulus4j.crypto.internal.mac.MACCalculatorFactoryImpl$SHA1"
14:43:19,576 TRACE [main][CryptoRegistry] registerMACCalculatorFactory: algorithmName="HMAC-SHA1" factoryClass="org.cumulus4j.crypto.internal.mac.MACCalculatorFactoryImpl$SHA1"
14:43:19,576 TRACE [main][CryptoRegistry] registerMACCalculatorFactory: algorithmName="HMAC/SHA1" factoryClass="org.cumulus4j.crypto.internal.mac.MACCalculatorFactoryImpl$SHA1"
14:43:19,577 TRACE [main][CryptoRegistry] registerMACCalculatorFactory: algorithmName="HMACSHA224" factoryClass="org.cumulus4j.crypto.internal.mac.MACCalculatorFactoryImpl$SHA224"
14:43:19,577 TRACE [main][CryptoRegistry] registerMACCalculatorFactory: algorithmName="HMAC-SHA224" factoryClass="org.cumulus4j.crypto.internal.mac.MACCalculatorFactoryImpl$SHA224"
14:43:19,578 TRACE [main][CryptoRegistry] registerMACCalculatorFactory: algorithmName="HMAC/SHA224" factoryClass="org.cumulus4j.crypto.internal.mac.MACCalculatorFactoryImpl$SHA224"
14:43:19,579 TRACE [main][CryptoRegistry] registerMACCalculatorFactory: algorithmName="HMACSHA256" factoryClass="org.cumulus4j.crypto.internal.mac.MACCalculatorFactoryImpl$SHA256"
14:43:19,579 TRACE [main][CryptoRegistry] registerMACCalculatorFactory: algorithmName="HMAC-SHA256" factoryClass="org.cumulus4j.crypto.internal.mac.MACCalculatorFactoryImpl$SHA256"
14:43:19,579 TRACE [main][CryptoRegistry] registerMACCalculatorFactory: algorithmName="HMAC/SHA256" factoryClass="org.cumulus4j.crypto.internal.mac.MACCalculatorFactoryImpl$SHA256"
14:43:19,580 TRACE [main][CryptoRegistry] registerMACCalculatorFactory: algorithmName="HMACSHA384" factoryClass="org.cumulus4j.crypto.internal.mac.MACCalculatorFactoryImpl$SHA384"
14:43:19,581 TRACE [main][CryptoRegistry] registerMACCalculatorFactory: algorithmName="HMAC-SHA384" factoryClass="org.cumulus4j.crypto.internal.mac.MACCalculatorFactoryImpl$SHA384"
14:43:19,581 TRACE [main][CryptoRegistry] registerMACCalculatorFactory: algorithmName="HMAC/SHA384" factoryClass="org.cumulus4j.crypto.internal.mac.MACCalculatorFactoryImpl$SHA384"
14:43:19,582 TRACE [main][CryptoRegistry] registerMACCalculatorFactory: algorithmName="HMACSHA512" factoryClass="org.cumulus4j.crypto.internal.mac.MACCalculatorFactoryImpl$SHA512"
14:43:19,582 TRACE [main][CryptoRegistry] registerMACCalculatorFactory: algorithmName="HMAC-SHA512" factoryClass="org.cumulus4j.crypto.internal.mac.MACCalculatorFactoryImpl$SHA512"
14:43:19,582 TRACE [main][CryptoRegistry] registerMACCalculatorFactory: algorithmName="HMAC/SHA512" factoryClass="org.cumulus4j.crypto.internal.mac.MACCalculatorFactoryImpl$SHA512"
14:43:19,583 TRACE [main][CryptoRegistry] registerMACCalculatorFactory: algorithmName="HMACRIPEMD128" factoryClass="org.cumulus4j.crypto.internal.mac.MACCalculatorFactoryImpl$RIPEMD128"
14:43:19,584 TRACE [main][CryptoRegistry] registerMACCalculatorFactory: algorithmName="HMAC-RIPEMD128" factoryClass="org.cumulus4j.crypto.internal.mac.MACCalculatorFactoryImpl$RIPEMD128"
14:43:19,584 TRACE [main][CryptoRegistry] registerMACCalculatorFactory: algorithmName="HMAC/RIPEMD128" factoryClass="org.cumulus4j.crypto.internal.mac.MACCalculatorFactoryImpl$RIPEMD128"
14:43:19,585 TRACE [main][CryptoRegistry] registerMACCalculatorFactory: algorithmName="HMACRIPEMD160" factoryClass="org.cumulus4j.crypto.internal.mac.MACCalculatorFactoryImpl$RIPEMD160"
14:43:19,585 TRACE [main][CryptoRegistry] registerMACCalculatorFactory: algorithmName="HMAC-RIPEMD160" factoryClass="org.cumulus4j.crypto.internal.mac.MACCalculatorFactoryImpl$RIPEMD160"
14:43:19,585 TRACE [main][CryptoRegistry] registerMACCalculatorFactory: algorithmName="HMAC/RIPEMD160" factoryClass="org.cumulus4j.crypto.internal.mac.MACCalculatorFactoryImpl$RIPEMD160"
14:43:19,587 TRACE [main][CryptoRegistry] registerMACCalculatorFactory: algorithmName="HMACTIGER" factoryClass="org.cumulus4j.crypto.internal.mac.MACCalculatorFactoryImpl$Tiger"
14:43:19,587 TRACE [main][CryptoRegistry] registerMACCalculatorFactory: algorithmName="HMAC-TIGER" factoryClass="org.cumulus4j.crypto.internal.mac.MACCalculatorFactoryImpl$Tiger"
14:43:19,587 TRACE [main][CryptoRegistry] registerMACCalculatorFactory: algorithmName="HMAC/TIGER" factoryClass="org.cumulus4j.crypto.internal.mac.MACCalculatorFactoryImpl$Tiger"
14:43:19,594 TRACE [main][CryptoRegistry] registerAsymmetricEngineClass: algorithmName="ElGamal" engineClass="org.bouncycastle.crypto.engines.ElGamalEngine"
14:43:19,599 TRACE [main][CryptoRegistry] registerAsymmetricEngineClass: algorithmName="NaccacheStern" engineClass="org.bouncycastle.crypto.engines.NaccacheSternEngine"
14:43:19,603 TRACE [main][CryptoRegistry] registerAsymmetricEngineClass: algorithmName="RSA" engineClass="org.bouncycastle.crypto.engines.RSABlindedEngine"
14:43:19,606 TRACE [main][CryptoRegistry] registerSymmetricEngineClass: algorithmName="AES" engineClass="org.bouncycastle.crypto.engines.AESEngine"
14:43:19,611 TRACE [main][CryptoRegistry] registerSymmetricEngineClass: algorithmName="AES.fast" engineClass="org.bouncycastle.crypto.engines.AESFastEngine"
14:43:19,614 TRACE [main][CryptoRegistry] registerSymmetricEngineClass: algorithmName="AES.light" engineClass="org.bouncycastle.crypto.engines.AESLightEngine"
14:43:19,617 TRACE [main][CryptoRegistry] registerSymmetricEngineClass: algorithmName="Blowfish" engineClass="org.bouncycastle.crypto.engines.BlowfishEngine"
14:43:19,621 TRACE [main][CryptoRegistry] registerSymmetricEngineClass: algorithmName="Camellia" engineClass="org.bouncycastle.crypto.engines.CamelliaEngine"
14:43:19,624 TRACE [main][CryptoRegistry] registerSymmetricEngineClass: algorithmName="Camellia.light" engineClass="org.bouncycastle.crypto.engines.CamelliaLightEngine"
14:43:19,629 TRACE [main][CryptoRegistry] registerSymmetricEngineClass: algorithmName="CAST5" engineClass="org.bouncycastle.crypto.engines.CAST5Engine"
14:43:19,631 TRACE [main][CryptoRegistry] registerSymmetricEngineClass: algorithmName="CAST6" engineClass="org.bouncycastle.crypto.engines.CAST6Engine"
14:43:19,636 TRACE [main][CryptoRegistry] registerSymmetricEngineClass: algorithmName="DESede" engineClass="org.bouncycastle.crypto.engines.DESedeEngine"
14:43:19,636 TRACE [main][CryptoRegistry] registerSymmetricEngineClass: algorithmName="DES" engineClass="org.bouncycastle.crypto.engines.DESEngine"
14:43:19,641 TRACE [main][CryptoRegistry] registerSymmetricEngineClass: algorithmName="GOST28147" engineClass="org.bouncycastle.crypto.engines.GOST28147Engine"
14:43:19,643 TRACE [main][CryptoRegistry] registerSymmetricEngineClass: algorithmName="Noekeon" engineClass="org.bouncycastle.crypto.engines.NoekeonEngine"
14:43:19,645 TRACE [main][CryptoRegistry] registerSymmetricEngineClass: algorithmName="Null" engineClass="org.bouncycastle.crypto.engines.NullEngine"
14:43:19,647 TRACE [main][CryptoRegistry] registerSymmetricEngineClass: algorithmName="RC2" engineClass="org.bouncycastle.crypto.engines.RC2Engine"
14:43:19,649 TRACE [main][CryptoRegistry] registerSymmetricEngineClass: algorithmName="RC5-32" engineClass="org.bouncycastle.crypto.engines.RC532Engine"
14:43:19,651 TRACE [main][CryptoRegistry] registerSymmetricEngineClass: algorithmName="RC5-64" engineClass="org.bouncycastle.crypto.engines.RC564Engine"
14:43:19,653 TRACE [main][CryptoRegistry] registerSymmetricEngineClass: algorithmName="RC6" engineClass="org.bouncycastle.crypto.engines.RC6Engine"
14:43:19,656 TRACE [main][CryptoRegistry] registerSymmetricEngineClass: algorithmName="Rijndael" engineClass="org.bouncycastle.crypto.engines.RijndaelEngine"
14:43:19,659 TRACE [main][CryptoRegistry] registerSymmetricEngineClass: algorithmName="SEED" engineClass="org.bouncycastle.crypto.engines.SEEDEngine"
14:43:19,662 TRACE [main][CryptoRegistry] registerSymmetricEngineClass: algorithmName="Serpent" engineClass="org.bouncycastle.crypto.engines.SerpentEngine"
14:43:19,664 TRACE [main][CryptoRegistry] registerSymmetricEngineClass: algorithmName="SKIPJACK" engineClass="org.bouncycastle.crypto.engines.SkipjackEngine"
14:43:19,666 TRACE [main][CryptoRegistry] registerSymmetricEngineClass: algorithmName="TEA" engineClass="org.bouncycastle.crypto.engines.TEAEngine"
14:43:19,670 TRACE [main][CryptoRegistry] registerSymmetricEngineClass: algorithmName="Twofish" engineClass="org.bouncycastle.crypto.engines.TwofishEngine"
14:43:19,672 TRACE [main][CryptoRegistry] registerSymmetricEngineClass: algorithmName="XTEA" engineClass="org.bouncycastle.crypto.engines.XTEAEngine"
14:43:19,675 TRACE [main][CryptoRegistry] registerSymmetricEngineClass: algorithmName="Grain-128" engineClass="org.bouncycastle.crypto.engines.Grain128Engine"
14:43:19,677 TRACE [main][CryptoRegistry] registerSymmetricEngineClass: algorithmName="GRAIN-V1" engineClass="org.bouncycastle.crypto.engines.Grainv1Engine"
14:43:19,680 TRACE [main][CryptoRegistry] registerSymmetricEngineClass: algorithmName="HC-128" engineClass="org.bouncycastle.crypto.engines.HC128Engine"
14:43:19,681 TRACE [main][CryptoRegistry] registerSymmetricEngineClass: algorithmName="HC-256" engineClass="org.bouncycastle.crypto.engines.HC256Engine"
14:43:19,684 TRACE [main][CryptoRegistry] registerSymmetricEngineClass: algorithmName="ISAAC" engineClass="org.bouncycastle.crypto.engines.ISAACEngine"
14:43:19,685 TRACE [main][CryptoRegistry] registerSymmetricEngineClass: algorithmName="RC4" engineClass="org.bouncycastle.crypto.engines.RC4Engine"
14:43:19,689 TRACE [main][CryptoRegistry] registerSymmetricEngineClass: algorithmName="Salsa20" engineClass="org.bouncycastle.crypto.engines.Salsa20Engine"
14:43:19,691 TRACE [main][CryptoRegistry] registerBlockCipherMode: modeName="CBC" modeClass="org.bouncycastle.crypto.modes.CBCBlockCipher"
14:43:19,694 TRACE [main][CryptoRegistry] registerAEADBlockCipherMode: modeName="CCM" modeClass="org.bouncycastle.crypto.modes.CCMBlockCipher"
14:43:19,696 TRACE [main][CryptoRegistry] registerBlockCipherMode: modeName="CFB" modeClass="org.cumulus4j.crypto.internal.symmetric.mode.C4jCFBBlockCipher"
14:43:19,696 TRACE [main][CryptoRegistry] registerBlockCipherMode: modeName="CFB8" modeClass="org.cumulus4j.crypto.internal.symmetric.mode.C4jCFBBlockCipher"
14:43:19,697 TRACE [main][CryptoRegistry] registerBlockCipherMode: modeName="CFB16" modeClass="org.cumulus4j.crypto.internal.symmetric.mode.C4jCFBBlockCipher"
14:43:19,697 TRACE [main][CryptoRegistry] registerBlockCipherMode: modeName="CFB24" modeClass="org.cumulus4j.crypto.internal.symmetric.mode.C4jCFBBlockCipher"
14:43:19,697 TRACE [main][CryptoRegistry] registerBlockCipherMode: modeName="CFB32" modeClass="org.cumulus4j.crypto.internal.symmetric.mode.C4jCFBBlockCipher"
14:43:19,697 TRACE [main][CryptoRegistry] registerBlockCipherMode: modeName="CFB40" modeClass="org.cumulus4j.crypto.internal.symmetric.mode.C4jCFBBlockCipher"
14:43:19,697 TRACE [main][CryptoRegistry] registerBlockCipherMode: modeName="CFB48" modeClass="org.cumulus4j.crypto.internal.symmetric.mode.C4jCFBBlockCipher"
14:43:19,697 TRACE [main][CryptoRegistry] registerBlockCipherMode: modeName="CFB56" modeClass="org.cumulus4j.crypto.internal.symmetric.mode.C4jCFBBlockCipher"
14:43:19,697 TRACE [main][CryptoRegistry] registerBlockCipherMode: modeName="CFB64" modeClass="org.cumulus4j.crypto.internal.symmetric.mode.C4jCFBBlockCipher"
14:43:19,697 TRACE [main][CryptoRegistry] registerBlockCipherMode: modeName="CFB72" modeClass="org.cumulus4j.crypto.internal.symmetric.mode.C4jCFBBlockCipher"
14:43:19,698 TRACE [main][CryptoRegistry] registerBlockCipherMode: modeName="CFB80" modeClass="org.cumulus4j.crypto.internal.symmetric.mode.C4jCFBBlockCipher"
14:43:19,698 TRACE [main][CryptoRegistry] registerBlockCipherMode: modeName="CFB88" modeClass="org.cumulus4j.crypto.internal.symmetric.mode.C4jCFBBlockCipher"
14:43:19,698 TRACE [main][CryptoRegistry] registerBlockCipherMode: modeName="CFB96" modeClass="org.cumulus4j.crypto.internal.symmetric.mode.C4jCFBBlockCipher"
14:43:19,698 TRACE [main][CryptoRegistry] registerBlockCipherMode: modeName="CFB104" modeClass="org.cumulus4j.crypto.internal.symmetric.mode.C4jCFBBlockCipher"
14:43:19,698 TRACE [main][CryptoRegistry] registerBlockCipherMode: modeName="CFB112" modeClass="org.cumulus4j.crypto.internal.symmetric.mode.C4jCFBBlockCipher"
14:43:19,698 TRACE [main][CryptoRegistry] registerBlockCipherMode: modeName="CFB120" modeClass="org.cumulus4j.crypto.internal.symmetric.mode.C4jCFBBlockCipher"
14:43:19,698 TRACE [main][CryptoRegistry] registerBlockCipherMode: modeName="CFB128" modeClass="org.cumulus4j.crypto.internal.symmetric.mode.C4jCFBBlockCipher"
14:43:19,698 TRACE [main][CryptoRegistry] registerBlockCipherMode: modeName="CFB136" modeClass="org.cumulus4j.crypto.internal.symmetric.mode.C4jCFBBlockCipher"
14:43:19,698 TRACE [main][CryptoRegistry] registerBlockCipherMode: modeName="CFB144" modeClass="org.cumulus4j.crypto.internal.symmetric.mode.C4jCFBBlockCipher"
14:43:19,699 TRACE [main][CryptoRegistry] registerBlockCipherMode: modeName="CFB152" modeClass="org.cumulus4j.crypto.internal.symmetric.mode.C4jCFBBlockCipher"
14:43:19,699 TRACE [main][CryptoRegistry] registerBlockCipherMode: modeName="CFB160" modeClass="org.cumulus4j.crypto.internal.symmetric.mode.C4jCFBBlockCipher"
14:43:19,699 TRACE [main][CryptoRegistry] registerBlockCipherMode: modeName="CFB168" modeClass="org.cumulus4j.crypto.internal.symmetric.mode.C4jCFBBlockCipher"
14:43:19,699 TRACE [main][CryptoRegistry] registerBlockCipherMode: modeName="CFB176" modeClass="org.cumulus4j.crypto.internal.symmetric.mode.C4jCFBBlockCipher"
14:43:19,699 TRACE [main][CryptoRegistry] registerBlockCipherMode: modeName="CFB184" modeClass="org.cumulus4j.crypto.internal.symmetric.mode.C4jCFBBlockCipher"
14:43:19,699 TRACE [main][CryptoRegistry] registerBlockCipherMode: modeName="CFB192" modeClass="org.cumulus4j.crypto.internal.symmetric.mode.C4jCFBBlockCipher"
14:43:19,699 TRACE [main][CryptoRegistry] registerBlockCipherMode: modeName="CFB200" modeClass="org.cumulus4j.crypto.internal.symmetric.mode.C4jCFBBlockCipher"
14:43:19,700 TRACE [main][CryptoRegistry] registerBlockCipherMode: modeName="CFB208" modeClass="org.cumulus4j.crypto.internal.symmetric.mode.C4jCFBBlockCipher"
14:43:19,700 TRACE [main][CryptoRegistry] registerBlockCipherMode: modeName="CFB216" modeClass="org.cumulus4j.crypto.internal.symmetric.mode.C4jCFBBlockCipher"
14:43:19,700 TRACE [main][CryptoRegistry] registerBlockCipherMode: modeName="CFB224" modeClass="org.cumulus4j.crypto.internal.symmetric.mode.C4jCFBBlockCipher"
14:43:19,700 TRACE [main][CryptoRegistry] registerBlockCipherMode: modeName="CFB232" modeClass="org.cumulus4j.crypto.internal.symmetric.mode.C4jCFBBlockCipher"
14:43:19,700 TRACE [main][CryptoRegistry] registerBlockCipherMode: modeName="CFB240" modeClass="org.cumulus4j.crypto.internal.symmetric.mode.C4jCFBBlockCipher"
14:43:19,700 TRACE [main][CryptoRegistry] registerBlockCipherMode: modeName="CFB248" modeClass="org.cumulus4j.crypto.internal.symmetric.mode.C4jCFBBlockCipher"
14:43:19,700 TRACE [main][CryptoRegistry] registerBlockCipherMode: modeName="CFB256" modeClass="org.cumulus4j.crypto.internal.symmetric.mode.C4jCFBBlockCipher"
14:43:19,702 TRACE [main][CryptoRegistry] registerBufferedBlockCipherMode: modeName="CTS" modeClass="org.bouncycastle.crypto.modes.CTSBlockCipher"
14:43:19,703 TRACE [main][CryptoRegistry] registerBufferedBlockCipherMode: modeName="CBC-CTS" modeClass="org.cumulus4j.crypto.internal.symmetric.mode.C4jCBCCTSBlockCipher"
14:43:19,705 TRACE [main][CryptoRegistry] registerAEADBlockCipherMode: modeName="EAX" modeClass="org.bouncycastle.crypto.modes.EAXBlockCipher"
14:43:19,706 TRACE [main][CryptoRegistry] registerAEADBlockCipherMode: modeName="GCM" modeClass="org.bouncycastle.crypto.modes.GCMBlockCipher"
14:43:19,708 TRACE [main][CryptoRegistry] registerBlockCipherMode: modeName="GOFB" modeClass="org.bouncycastle.crypto.modes.GOFBBlockCipher"
14:43:19,710 TRACE [main][CryptoRegistry] registerBlockCipherMode: modeName="OFB" modeClass="org.cumulus4j.crypto.internal.symmetric.mode.C4jOFBBlockCipher"
14:43:19,711 TRACE [main][CryptoRegistry] registerBlockCipherMode: modeName="OFB8" modeClass="org.cumulus4j.crypto.internal.symmetric.mode.C4jOFBBlockCipher"
14:43:19,711 TRACE [main][CryptoRegistry] registerBlockCipherMode: modeName="OFB16" modeClass="org.cumulus4j.crypto.internal.symmetric.mode.C4jOFBBlockCipher"
14:43:19,711 TRACE [main][CryptoRegistry] registerBlockCipherMode: modeName="OFB24" modeClass="org.cumulus4j.crypto.internal.symmetric.mode.C4jOFBBlockCipher"
14:43:19,711 TRACE [main][CryptoRegistry] registerBlockCipherMode: modeName="OFB32" modeClass="org.cumulus4j.crypto.internal.symmetric.mode.C4jOFBBlockCipher"
14:43:19,711 TRACE [main][CryptoRegistry] registerBlockCipherMode: modeName="OFB40" modeClass="org.cumulus4j.crypto.internal.symmetric.mode.C4jOFBBlockCipher"
14:43:19,711 TRACE [main][CryptoRegistry] registerBlockCipherMode: modeName="OFB48" modeClass="org.cumulus4j.crypto.internal.symmetric.mode.C4jOFBBlockCipher"
14:43:19,711 TRACE [main][CryptoRegistry] registerBlockCipherMode: modeName="OFB56" modeClass="org.cumulus4j.crypto.internal.symmetric.mode.C4jOFBBlockCipher"
14:43:19,711 TRACE [main][CryptoRegistry] registerBlockCipherMode: modeName="OFB64" modeClass="org.cumulus4j.crypto.internal.symmetric.mode.C4jOFBBlockCipher"
14:43:19,712 TRACE [main][CryptoRegistry] registerBlockCipherMode: modeName="OFB72" modeClass="org.cumulus4j.crypto.internal.symmetric.mode.C4jOFBBlockCipher"
14:43:19,712 TRACE [main][CryptoRegistry] registerBlockCipherMode: modeName="OFB80" modeClass="org.cumulus4j.crypto.internal.symmetric.mode.C4jOFBBlockCipher"
14:43:19,712 TRACE [main][CryptoRegistry] registerBlockCipherMode: modeName="OFB88" modeClass="org.cumulus4j.crypto.internal.symmetric.mode.C4jOFBBlockCipher"
14:43:19,712 TRACE [main][CryptoRegistry] registerBlockCipherMode: modeName="OFB96" modeClass="org.cumulus4j.crypto.internal.symmetric.mode.C4jOFBBlockCipher"
14:43:19,712 TRACE [main][CryptoRegistry] registerBlockCipherMode: modeName="OFB104" modeClass="org.cumulus4j.crypto.internal.symmetric.mode.C4jOFBBlockCipher"
14:43:19,712 TRACE [main][CryptoRegistry] registerBlockCipherMode: modeName="OFB112" modeClass="org.cumulus4j.crypto.internal.symmetric.mode.C4jOFBBlockCipher"
14:43:19,712 TRACE [main][CryptoRegistry] registerBlockCipherMode: modeName="OFB120" modeClass="org.cumulus4j.crypto.internal.symmetric.mode.C4jOFBBlockCipher"
14:43:19,712 TRACE [main][CryptoRegistry] registerBlockCipherMode: modeName="OFB128" modeClass="org.cumulus4j.crypto.internal.symmetric.mode.C4jOFBBlockCipher"
14:43:19,712 TRACE [main][CryptoRegistry] registerBlockCipherMode: modeName="OFB136" modeClass="org.cumulus4j.crypto.internal.symmetric.mode.C4jOFBBlockCipher"
14:43:19,713 TRACE [main][CryptoRegistry] registerBlockCipherMode: modeName="OFB144" modeClass="org.cumulus4j.crypto.internal.symmetric.mode.C4jOFBBlockCipher"
14:43:19,713 TRACE [main][CryptoRegistry] registerBlockCipherMode: modeName="OFB152" modeClass="org.cumulus4j.crypto.internal.symmetric.mode.C4jOFBBlockCipher"
14:43:19,713 TRACE [main][CryptoRegistry] registerBlockCipherMode: modeName="OFB160" modeClass="org.cumulus4j.crypto.internal.symmetric.mode.C4jOFBBlockCipher"
14:43:19,713 TRACE [main][CryptoRegistry] registerBlockCipherMode: modeName="OFB168" modeClass="org.cumulus4j.crypto.internal.symmetric.mode.C4jOFBBlockCipher"
14:43:19,713 TRACE [main][CryptoRegistry] registerBlockCipherMode: modeName="OFB176" modeClass="org.cumulus4j.crypto.internal.symmetric.mode.C4jOFBBlockCipher"
14:43:19,713 TRACE [main][CryptoRegistry] registerBlockCipherMode: modeName="OFB184" modeClass="org.cumulus4j.crypto.internal.symmetric.mode.C4jOFBBlockCipher"
14:43:19,713 TRACE [main][CryptoRegistry] registerBlockCipherMode: modeName="OFB192" modeClass="org.cumulus4j.crypto.internal.symmetric.mode.C4jOFBBlockCipher"
14:43:19,713 TRACE [main][CryptoRegistry] registerBlockCipherMode: modeName="OFB200" modeClass="org.cumulus4j.crypto.internal.symmetric.mode.C4jOFBBlockCipher"
14:43:19,713 TRACE [main][CryptoRegistry] registerBlockCipherMode: modeName="OFB208" modeClass="org.cumulus4j.crypto.internal.symmetric.mode.C4jOFBBlockCipher"
14:43:19,714 TRACE [main][CryptoRegistry] registerBlockCipherMode: modeName="OFB216" modeClass="org.cumulus4j.crypto.internal.symmetric.mode.C4jOFBBlockCipher"
14:43:19,714 TRACE [main][CryptoRegistry] registerBlockCipherMode: modeName="OFB224" modeClass="org.cumulus4j.crypto.internal.symmetric.mode.C4jOFBBlockCipher"
14:43:19,714 TRACE [main][CryptoRegistry] registerBlockCipherMode: modeName="OFB232" modeClass="org.cumulus4j.crypto.internal.symmetric.mode.C4jOFBBlockCipher"
14:43:19,714 TRACE [main][CryptoRegistry] registerBlockCipherMode: modeName="OFB240" modeClass="org.cumulus4j.crypto.internal.symmetric.mode.C4jOFBBlockCipher"
14:43:19,714 TRACE [main][CryptoRegistry] registerBlockCipherMode: modeName="OFB248" modeClass="org.cumulus4j.crypto.internal.symmetric.mode.C4jOFBBlockCipher"
14:43:19,714 TRACE [main][CryptoRegistry] registerBlockCipherMode: modeName="OFB256" modeClass="org.cumulus4j.crypto.internal.symmetric.mode.C4jOFBBlockCipher"
14:43:19,716 TRACE [main][CryptoRegistry] registerBlockCipherMode: modeName="SIC" modeClass="org.bouncycastle.crypto.modes.SICBlockCipher"
14:43:19,732 DEBUG [main][CryptoRegistry] registerBlockCipherPadding: paddingName="ISO10126-2" paddingClass="org.bouncycastle.crypto.paddings.ISO10126d2Padding"
14:43:19,733 TRACE [main][CryptoRegistry] registerBlockCipherPadding: paddingName="ISO10126" paddingClass="org.bouncycastle.crypto.paddings.ISO10126d2Padding"
14:43:19,734 DEBUG [main][CryptoRegistry] registerBlockCipherPadding: paddingName="ISO7816-4" paddingClass="org.bouncycastle.crypto.paddings.ISO7816d4Padding"
14:43:19,736 DEBUG [main][CryptoRegistry] registerBlockCipherPadding: paddingName="PKCS7" paddingClass="org.bouncycastle.crypto.paddings.PKCS7Padding"
14:43:19,736 TRACE [main][CryptoRegistry] registerBlockCipherPadding: paddingName="PKCS5" paddingClass="org.bouncycastle.crypto.paddings.PKCS7Padding"
14:43:19,737 DEBUG [main][CryptoRegistry] registerBlockCipherPadding: paddingName="TBC" paddingClass="org.bouncycastle.crypto.paddings.TBCPadding"
14:43:19,739 DEBUG [main][CryptoRegistry] registerBlockCipherPadding: paddingName="X9.23" paddingClass="org.bouncycastle.crypto.paddings.X923Padding"
14:43:19,741 DEBUG [main][CryptoRegistry] registerBlockCipherPadding: paddingName="ZeroByte" paddingClass="org.bouncycastle.crypto.paddings.ZeroBytePadding"
14:43:19,742 TRACE [main][CryptoRegistry] registerAsymmetricBlockCipherPadding: paddingName="ISO9796-1" paddingClass="org.bouncycastle.crypto.encodings.ISO9796d1Encoding"
14:43:19,744 TRACE [main][CryptoRegistry] registerAsymmetricBlockCipherPadding: paddingName="OAEP" paddingClass="org.bouncycastle.crypto.encodings.OAEPEncoding"
14:43:19,744 TRACE [main][CryptoRegistry] registerAsymmetricBlockCipherPadding: paddingName="OAEPWITHSHA1ANDMGF1" paddingClass="org.bouncycastle.crypto.encodings.OAEPEncoding"
14:43:19,746 TRACE [main][CryptoRegistry] registerAsymmetricBlockCipherPadding: paddingName="PKCS1" paddingClass="org.bouncycastle.crypto.encodings.PKCS1Encoding"
14:43:19,758 TRACE [main][CryptoRegistry] registerAsymmetricCipherKeyPairGeneratorFactory: algorithmName="DH" factoryClass="org.cumulus4j.crypto.internal.asymmetric.keypairgenerator.DHBasicKeyPairGeneratorFactory"
14:43:19,759 TRACE [main][CryptoRegistry] registerAsymmetricCipherKeyPairGeneratorFactory: algorithmName="DSA" factoryClass="org.cumulus4j.crypto.internal.asymmetric.keypairgenerator.DSAKeyPairGeneratorFactory"
14:43:19,761 TRACE [main][CryptoRegistry] registerAsymmetricCipherKeyPairGeneratorFactory: algorithmName="ElGamal" factoryClass="org.cumulus4j.crypto.internal.asymmetric.keypairgenerator.ElGamalKeyPairGeneratorFactory"
14:43:19,762 TRACE [main][CryptoRegistry] registerAsymmetricCipherKeyPairGeneratorFactory: algorithmName="GOST3410" factoryClass="org.cumulus4j.crypto.internal.asymmetric.keypairgenerator.GOST3410KeyPairGeneratorFactory"
14:43:19,763 TRACE [main][CryptoRegistry] registerAsymmetricCipherKeyPairGeneratorFactory: algorithmName="NaccacheStern" factoryClass="org.cumulus4j.crypto.internal.asymmetric.keypairgenerator.NaccacheSternKeyPairGeneratorFactory"
14:43:19,767 TRACE [main][CryptoRegistry] registerAsymmetricCipherKeyPairGeneratorFactory: algorithmName="RSA" factoryClass="org.cumulus4j.crypto.internal.asymmetric.keypairgenerator.RSAKeyPairGeneratorFactory"
14:43:19,783 INFO [main][KeyStore] getMACAlgorithm: System property 'cumulus4j.KeyStore.macAlgorithm' is not set. Using default MAC algorithm 'NONE'.
14:43:19,890 INFO [main][KeyStore] getKeySize: System property 'cumulus4j.KeyStore.keySize' is not set. Using default key size (256 bit).
14:43:19,890 INFO [main][KeyStore] createUser: Created master-key with a size of 256 bits. This key will not be modified for this key-store anymore.
14:43:19,890 INFO [main][KeyStore] getEncryptionAlgorithm: System property 'cumulus4j.KeyStore.encryptionAlgorithm' is not set. Using default algorithm 'Twofish/GCM/NoPadding'.
14:43:19,910 INFO [main][KeyStore] getMACAlgorithm: System property 'cumulus4j.KeyStore.macAlgorithm' is not set. Using default MAC algorithm 'NONE'.
14:43:19,990 INFO [main][KeyStore] getKeySize: System property 'cumulus4j.KeyStore.keySize' is not set. Using default key size (256 bit).
14:43:19,995 INFO [main][KeyStore] createUser: Created master-key with a size of 256 bits. This key will not be modified for this key-store anymore.
14:43:19,995 INFO [main][KeyStore] getEncryptionAlgorithm: System property 'cumulus4j.KeyStore.encryptionAlgorithm' is not set. Using default algorithm 'Twofish/GCM/NoPadding'.
14:43:20,006 INFO [main][KeyStore] getMACAlgorithm: System property 'cumulus4j.KeyStore.macAlgorithm' is not set. Using default MAC algorithm 'NONE'.
14:43:20,019 INFO [main][KeyStore] getKeySize: System property 'cumulus4j.KeyStore.keySize' is not set. Using default key size (256 bit).
14:43:20,019 INFO [main][KeyStore] createUser: Created master-key with a size of 256 bits. This key will not be modified for this key-store anymore.
14:43:20,019 INFO [main][KeyStore] getEncryptionAlgorithm: System property 'cumulus4j.KeyStore.encryptionAlgorithm' is not set. Using default algorithm 'Twofish/GCM/NoPadding'.
14:43:20,027 INFO [main][KeyStore] getMACAlgorithm: System property 'cumulus4j.KeyStore.macAlgorithm' is not set. Using default MAC algorithm 'NONE'.
14:43:20,039 INFO [main][KeyStore] getKeySize: System property 'cumulus4j.KeyStore.keySize' is not set. Using default key size (256 bit).
14:43:20,040 INFO [main][KeyStore] createUser: Created master-key with a size of 256 bits. This key will not be modified for this key-store anymore.
14:43:20,040 INFO [main][KeyStore] getEncryptionAlgorithm: System property 'cumulus4j.KeyStore.encryptionAlgorithm' is not set. Using default algorithm 'Twofish/GCM/NoPadding'.
14:43:20,051 INFO [main][KeyStore] getMACAlgorithm: System property 'cumulus4j.KeyStore.macAlgorithm' is not set. Using default MAC algorithm 'NONE'.
Tests run: 5, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 2.981 sec
Running org.cumulus4j.keystore.test.DateDependentKeyStrategyTest
14:43:20,137 DEBUG [main][DateDependentKeyStrategy] init: Calculated numberOfKeysToGenerate=5761
14:43:20,146 INFO [main][KeyStore] getKeySize: System property 'cumulus4j.KeyStore.keySize' is not set. Using default key size (256 bit).
14:43:20,147 INFO [main][KeyStore] createUser: Created master-key with a size of 256 bits. This key will not be modified for this key-store anymore.
14:43:20,147 INFO [main][KeyStore] getEncryptionAlgorithm: System property 'cumulus4j.KeyStore.encryptionAlgorithm' is not set. Using default algorithm 'Twofish/GCM/NoPadding'.
14:43:20,155 INFO [main][KeyStore] getMACAlgorithm: System property 'cumulus4j.KeyStore.macAlgorithm' is not set. Using default MAC algorithm 'NONE'.
14:43:20,405 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@48dd639c
14:43:20,405 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@3eb6bc23
14:43:20,406 DEBUG [Finalizer][CachedMasterKey] clear: Clearing for userName='marco'.
14:43:20,406 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@3eb6bc23
14:43:20,406 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@4ef9bdff
14:43:20,406 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@6e28d8da
14:43:20,406 DEBUG [Finalizer][CachedMasterKey] clear: Clearing for userName='marco'.
14:43:20,406 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@4ef9bdff
14:43:20,406 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@3bb508b6
14:43:20,406 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@6a4f0359
14:43:20,407 DEBUG [Finalizer][CachedMasterKey] clear: Clearing for userName='marco'.
14:43:20,407 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@3bb508b6
14:43:20,407 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@6964fe95
14:43:20,407 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@65861e41
14:43:20,407 DEBUG [Finalizer][CachedMasterKey] clear: Clearing for userName='marco'.
14:43:20,407 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@6964fe95
14:43:20,407 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@482c7179
14:43:20,407 DEBUG [Finalizer][CachedMasterKey] clear: Clearing for userName='marco'.
14:43:20,407 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@482c7179
14:43:20,408 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@5dcde3f3
14:43:20,408 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@783096a1
14:43:20,408 DEBUG [Finalizer][CachedMasterKey] clear: Clearing for userName='marco'.
14:43:20,408 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@5dcde3f3
14:43:20,408 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@3df161ac
14:43:20,408 DEBUG [Finalizer][CachedMasterKey] clear: Clearing for userName='marco'.
14:43:20,408 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@3df161ac
14:43:20,408 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@324382f9
14:43:20,415 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@6e4bc336
14:43:20,416 DEBUG [Finalizer][CachedMasterKey] clear: Clearing for userName='marco'.
14:43:20,416 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@324382f9
Tests run: 1, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 3.883 sec
Running org.cumulus4j.keystore.test.KeyStoreUserTest
14:43:24,033 INFO [main][KeyStore] getKeySize: System property 'cumulus4j.KeyStore.keySize' is not set. Using default key size (256 bit).
14:43:24,033 INFO [main][KeyStore] createUser: Created master-key with a size of 256 bits. This key will not be modified for this key-store anymore.
14:43:24,034 INFO [main][KeyStore] getEncryptionAlgorithm: System property 'cumulus4j.KeyStore.encryptionAlgorithm' is not set. Using default algorithm 'Twofish/GCM/NoPadding'.
14:43:24,044 INFO [main][KeyStore] getMACAlgorithm: System property 'cumulus4j.KeyStore.macAlgorithm' is not set. Using default MAC algorithm 'NONE'.
14:43:24,059 INFO [main][KeyStore] getKeySize: System property 'cumulus4j.KeyStore.keySize' is not set. Using default key size (256 bit).
14:43:24,059 INFO [main][KeyStore] createUser: Created master-key with a size of 256 bits. This key will not be modified for this key-store anymore.
14:43:24,059 INFO [main][KeyStore] getEncryptionAlgorithm: System property 'cumulus4j.KeyStore.encryptionAlgorithm' is not set. Using default algorithm 'Twofish/GCM/NoPadding'.
14:43:24,065 INFO [main][KeyStore] getMACAlgorithm: System property 'cumulus4j.KeyStore.macAlgorithm' is not set. Using default MAC algorithm 'NONE'.
14:43:24,070 INFO [main][KeyStore] getKeySize: System property 'cumulus4j.KeyStore.keySize' is not set. Using default key size (256 bit).
14:43:24,070 INFO [main][KeyStore] createUser: Created master-key with a size of 256 bits. This key will not be modified for this key-store anymore.
14:43:24,071 INFO [main][KeyStore] getEncryptionAlgorithm: System property 'cumulus4j.KeyStore.encryptionAlgorithm' is not set. Using default algorithm 'Twofish/GCM/NoPadding'.
14:43:24,076 INFO [main][KeyStore] getMACAlgorithm: System property 'cumulus4j.KeyStore.macAlgorithm' is not set. Using default MAC algorithm 'NONE'.
14:43:24,077 WARN [main][KeyStore] getMasterKey: Unknown userName: null
14:43:24,080 INFO [main][KeyStore] getKeySize: System property 'cumulus4j.KeyStore.keySize' is not set. Using default key size (256 bit).
14:43:24,081 INFO [main][KeyStore] createUser: Created master-key with a size of 256 bits. This key will not be modified for this key-store anymore.
14:43:24,081 INFO [main][KeyStore] getEncryptionAlgorithm: System property 'cumulus4j.KeyStore.encryptionAlgorithm' is not set. Using default algorithm 'Twofish/GCM/NoPadding'.
14:43:24,087 INFO [main][KeyStore] getMACAlgorithm: System property 'cumulus4j.KeyStore.macAlgorithm' is not set. Using default MAC algorithm 'NONE'.
14:43:24,093 WARN [main][KeyStore] getMasterKey: Caught CryptoException indicating a wrong password for user "marco"!
14:43:24,094 WARN [main][KeyStore] getMasterKey: Wrong password for user "marco"! MAC verification failed.
14:43:24,096 INFO [main][KeyStore] getKeySize: System property 'cumulus4j.KeyStore.keySize' is not set. Using default key size (256 bit).
14:43:24,097 INFO [main][KeyStore] createUser: Created master-key with a size of 256 bits. This key will not be modified for this key-store anymore.
14:43:24,097 INFO [main][KeyStore] getEncryptionAlgorithm: System property 'cumulus4j.KeyStore.encryptionAlgorithm' is not set. Using default algorithm 'Twofish/GCM/NoPadding'.
14:43:24,102 INFO [main][KeyStore] getMACAlgorithm: System property 'cumulus4j.KeyStore.macAlgorithm' is not set. Using default MAC algorithm 'NONE'.
14:43:24,121 DEBUG [main][CachedMasterKey] clear: Clearing for userName='marco'.
14:43:24,121 DEBUG [main][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@4aaa045f
14:43:24,124 INFO [main][KeyStore] getKeySize: System property 'cumulus4j.KeyStore.keySize' is not set. Using default key size (256 bit).
14:43:24,124 INFO [main][KeyStore] createUser: Created master-key with a size of 256 bits. This key will not be modified for this key-store anymore.
14:43:24,124 INFO [main][KeyStore] getEncryptionAlgorithm: System property 'cumulus4j.KeyStore.encryptionAlgorithm' is not set. Using default algorithm 'Twofish/GCM/NoPadding'.
14:43:24,130 INFO [main][KeyStore] getMACAlgorithm: System property 'cumulus4j.KeyStore.macAlgorithm' is not set. Using default MAC algorithm 'NONE'.
14:43:24,150 DEBUG [main][CachedMasterKey] clear: Clearing for userName='bieber'.
14:43:24,150 DEBUG [main][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@60051f44
14:43:24,153 INFO [main][KeyStore] getKeySize: System property 'cumulus4j.KeyStore.keySize' is not set. Using default key size (256 bit).
14:43:24,153 INFO [main][KeyStore] createUser: Created master-key with a size of 256 bits. This key will not be modified for this key-store anymore.
14:43:24,153 INFO [main][KeyStore] getEncryptionAlgorithm: System property 'cumulus4j.KeyStore.encryptionAlgorithm' is not set. Using default algorithm 'Twofish/GCM/NoPadding'.
14:43:24,159 INFO [main][KeyStore] getMACAlgorithm: System property 'cumulus4j.KeyStore.macAlgorithm' is not set. Using default MAC algorithm 'NONE'.
14:43:24,178 DEBUG [main][CachedMasterKey] clear: Clearing for userName='marco'.
14:43:24,178 DEBUG [main][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@7047da9b
14:43:24,181 INFO [main][KeyStore] getKeySize: System property 'cumulus4j.KeyStore.keySize' is not set. Using default key size (256 bit).
14:43:24,181 INFO [main][KeyStore] createUser: Created master-key with a size of 256 bits. This key will not be modified for this key-store anymore.
14:43:24,181 INFO [main][KeyStore] getEncryptionAlgorithm: System property 'cumulus4j.KeyStore.encryptionAlgorithm' is not set. Using default algorithm 'Twofish/GCM/NoPadding'.
14:43:24,186 INFO [main][KeyStore] getMACAlgorithm: System property 'cumulus4j.KeyStore.macAlgorithm' is not set. Using default MAC algorithm 'NONE'.
14:43:24,223 WARN [main][KeyStore] getMasterKey: Caught CryptoException indicating a wrong password for user "bieber"!
14:43:24,223 WARN [main][KeyStore] getMasterKey: Wrong password for user "bieber"! MAC verification failed.
14:43:24,225 INFO [main][KeyStore] getKeySize: System property 'cumulus4j.KeyStore.keySize' is not set. Using default key size (256 bit).
14:43:24,226 INFO [main][KeyStore] createUser: Created master-key with a size of 256 bits. This key will not be modified for this key-store anymore.
14:43:24,226 INFO [main][KeyStore] getEncryptionAlgorithm: System property 'cumulus4j.KeyStore.encryptionAlgorithm' is not set. Using default algorithm 'Twofish/GCM/NoPadding'.
14:43:24,231 INFO [main][KeyStore] getMACAlgorithm: System property 'cumulus4j.KeyStore.macAlgorithm' is not set. Using default MAC algorithm 'NONE'.
14:43:24,259 WARN [main][KeyStore] getMasterKey: Caught CryptoException indicating a wrong password for user "marco"!
14:43:24,259 WARN [main][KeyStore] getMasterKey: Wrong password for user "marco"! MAC verification failed.
Tests run: 9, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 0.243 sec
Running org.cumulus4j.keystore.test.KeyStoreKey_AES_CBC_PKCS5Padding_Test
14:43:24,279 WARN [main][KeyStore] getMasterKey: Unknown userName: marco
14:43:24,282 INFO [main][KeyStore] getKeySize: System property 'cumulus4j.KeyStore.keySize' is not set. Using default key size (256 bit).
14:43:24,283 INFO [main][KeyStore] createUser: Created master-key with a size of 256 bits. This key will not be modified for this key-store anymore.
14:43:24,283 INFO [main][KeyStore] getEncryptionAlgorithm: System property 'cumulus4j.KeyStore.encryptionAlgorithm' is set to 'AES/CBC/PKCS5Padding'. Using this encryption algorithm.
14:43:24,292 INFO [main][KeyStore] getMACAlgorithm: System property 'cumulus4j.KeyStore.macAlgorithm' is set to 'HMACSHA1'. Using this MAC algorithm.
14:43:24,303 WARN [main][KeyStore] getMasterKey: Caught CryptoException indicating a wrong password for user "marco"!
14:43:24,303 WARN [main][KeyStore] getMasterKey: Wrong password for user "marco"! MAC verification failed.
14:43:24,306 INFO [main][KeyStore] getKeySize: System property 'cumulus4j.KeyStore.keySize' is not set. Using default key size (256 bit).
14:43:24,306 INFO [main][KeyStore] createUser: Created master-key with a size of 256 bits. This key will not be modified for this key-store anymore.
14:43:24,306 INFO [main][KeyStore] getEncryptionAlgorithm: System property 'cumulus4j.KeyStore.encryptionAlgorithm' is set to 'AES/CBC/PKCS5Padding'. Using this encryption algorithm.
14:43:24,312 INFO [main][KeyStore] getMACAlgorithm: System property 'cumulus4j.KeyStore.macAlgorithm' is set to 'HMACSHA1'. Using this MAC algorithm.
14:43:24,320 DEBUG [main][CachedMasterKey] clear: Clearing for userName='marco'.
14:43:24,320 DEBUG [main][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@3af89e13
14:43:24,327 DEBUG [main][CachedMasterKey] clear: Clearing for userName='marco'.
14:43:24,327 DEBUG [main][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@18520fa4
14:43:24,336 DEBUG [main][CachedMasterKey] clear: Clearing for userName='marco'.
14:43:24,336 DEBUG [main][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@3380e475
14:43:24,343 DEBUG [main][CachedMasterKey] clear: Clearing for userName='marco'.
14:43:24,343 DEBUG [main][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@5316d7bd
14:43:24,353 DEBUG [main][CachedMasterKey] clear: Clearing for userName='marco'.
14:43:24,353 DEBUG [main][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@ade3e9
14:43:24,367 INFO [main][KeyStore] getKeySize: System property 'cumulus4j.KeyStore.keySize' is not set. Using default key size (256 bit).
14:43:24,367 INFO [main][KeyStore] createUser: Created master-key with a size of 256 bits. This key will not be modified for this key-store anymore.
14:43:24,367 INFO [main][KeyStore] getEncryptionAlgorithm: System property 'cumulus4j.KeyStore.encryptionAlgorithm' is set to 'AES/CBC/PKCS5Padding'. Using this encryption algorithm.
14:43:24,373 INFO [main][KeyStore] getMACAlgorithm: System property 'cumulus4j.KeyStore.macAlgorithm' is set to 'HMACSHA1'. Using this MAC algorithm.
14:43:24,382 INFO [main][KeyStore] getMACAlgorithm: System property 'cumulus4j.KeyStore.macAlgorithm' is set to 'HMACSHA1'. Using this MAC algorithm.
14:43:24,383 INFO [main][KeyStore] getEncryptionAlgorithm: System property 'cumulus4j.KeyStore.encryptionAlgorithm' is set to 'AES/CBC/PKCS5Padding'. Using this encryption algorithm.
14:43:24,384 INFO [main][KeyStore] getKeySize: System property 'cumulus4j.KeyStore.keySize' is not set. Using default key size (256 bit).
14:43:24,398 INFO [main][KeyStore] getKeySize: System property 'cumulus4j.KeyStore.keySize' is not set. Using default key size (256 bit).
14:43:24,398 INFO [main][KeyStore] createUser: Created master-key with a size of 256 bits. This key will not be modified for this key-store anymore.
14:43:24,398 INFO [main][KeyStore] getEncryptionAlgorithm: System property 'cumulus4j.KeyStore.encryptionAlgorithm' is set to 'AES/CBC/PKCS5Padding'. Using this encryption algorithm.
14:43:24,404 INFO [main][KeyStore] getMACAlgorithm: System property 'cumulus4j.KeyStore.macAlgorithm' is set to 'HMACSHA1'. Using this MAC algorithm.
14:43:46,139 DEBUG [Finalizer][CachedMasterKey] clear: Clearing for userName='marco'.
14:43:46,140 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@490f163b
14:43:46,140 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@7d7ca0f5
14:43:46,140 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@490f163b
14:43:46,141 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@68bd9607
14:43:46,146 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@7618d289
14:43:46,147 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@1a996ff
14:43:46,147 DEBUG [Finalizer][CachedMasterKey] clear: Clearing for userName='bieber'.
14:43:46,147 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@263ee73b
14:43:46,148 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@6bbee61a
14:43:46,148 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@4aaa045f
14:43:46,148 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@263ee73b
14:43:46,149 DEBUG [Finalizer][CachedMasterKey] clear: Clearing for userName='marco'.
14:43:46,149 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@36c0b403
14:43:46,149 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@256a4d0a
14:43:46,149 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@36c0b403
14:43:46,149 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@60051f44
14:43:46,150 DEBUG [Finalizer][CachedMasterKey] clear: Clearing for userName='bieber'.
14:43:46,150 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@59ceb2fe
14:43:46,151 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@11496fc2
14:43:46,151 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@7047da9b
14:43:46,151 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@59ceb2fe
14:43:46,152 DEBUG [Finalizer][CachedMasterKey] clear: Clearing for userName='bieber'.
14:43:46,152 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@2f13f599
14:43:46,152 DEBUG [Finalizer][CachedMasterKey] clear: Clearing for userName='marco'.
14:43:46,152 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@476127f4
14:43:46,152 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@3b8628c8
14:43:46,153 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@476127f4
14:43:46,153 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@64df80ff
14:43:46,153 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@2f13f599
14:43:46,154 DEBUG [Finalizer][CachedMasterKey] clear: Clearing for userName='marco'.
14:43:46,154 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@6c10fa4d
14:43:46,154 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@4ea10ca8
14:43:46,154 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@2f4611ec
14:43:46,155 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@6c10fa4d
14:43:46,164 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@19dc2481
14:43:46,164 DEBUG [Finalizer][CachedMasterKey] clear: Clearing for userName='marco'.
14:43:46,165 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@4fc063f6
14:43:46,165 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@5fe2d461
14:43:46,165 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@3af89e13
14:43:46,165 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@18520fa4
14:43:46,166 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@3380e475
14:43:46,166 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@5316d7bd
14:43:46,166 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@ade3e9
14:43:46,166 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@4fc063f6
14:43:46,173 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@4e5abf3f
14:43:46,174 DEBUG [Finalizer][CachedMasterKey] clear: Clearing for userName='marco'.
14:43:46,174 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@74a7ef62
14:43:46,174 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@74a7ef62
14:43:46,174 DEBUG [Finalizer][CachedMasterKey] clear: Clearing for userName='marco'.
14:43:46,175 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@2998cbaa
14:43:46,175 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@2998cbaa
14:43:46,175 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@6e631b3b
14:43:56,753 INFO [main][KeyStoreKeyTest] generateAndReadManyKeysIndividually: firstKeyID=1 lastKeyID=5000
14:43:57,064 INFO [main][KeyStoreKeyTest] generateAndReadManyKeysIndividually (5000 keys):
00.generateManyKeysIndividually invocationCount=1
recursionLevel=0 invocationCount=1 accumulatedTime=32345 minTime=32345 maxTime=32345
05.generateOneKey invocationCount=5000
recursionLevel=0 invocationCount=5000 accumulatedTime=32264 minTime=1 maxTime=38
07.readKeyStore invocationCount=1
recursionLevel=0 invocationCount=1 accumulatedTime=121 minTime=121 maxTime=121
10.readManyKeys invocationCount=1
recursionLevel=0 invocationCount=1 accumulatedTime=189 minTime=189 maxTime=189
14:43:57,067 INFO [main][KeyStore] getKeySize: System property 'cumulus4j.KeyStore.keySize' is not set. Using default key size (256 bit).
14:43:57,067 INFO [main][KeyStore] createUser: Created master-key with a size of 256 bits. This key will not be modified for this key-store anymore.
14:43:57,067 INFO [main][KeyStore] getEncryptionAlgorithm: System property 'cumulus4j.KeyStore.encryptionAlgorithm' is set to 'AES/CBC/PKCS5Padding'. Using this encryption algorithm.
14:43:57,073 INFO [main][KeyStore] getMACAlgorithm: System property 'cumulus4j.KeyStore.macAlgorithm' is set to 'HMACSHA1'. Using this MAC algorithm.
14:43:58,570 DEBUG [Finalizer][CachedMasterKey] clear: Clearing for userName='marco'.
14:43:58,575 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@8c30cbb
14:43:58,576 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@8c30cbb
14:43:58,576 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@3d78cd7b
14:44:03,870 INFO [main][KeyStoreKeyTest] generateAndReadManyKeysBulk (35000 keys):
00.generateManyKeysBulk invocationCount=1
recursionLevel=0 invocationCount=1 accumulatedTime=5438 minTime=5438 maxTime=5438
07.readKeyStore invocationCount=1
recursionLevel=0 invocationCount=1 accumulatedTime=207 minTime=207 maxTime=207
10.readManyKeys invocationCount=1
recursionLevel=0 invocationCount=1 accumulatedTime=1135 minTime=1135 maxTime=1135
Tests run: 6, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 39.605 sec
Running org.cumulus4j.keystore.test.KeyStoreKey_Twofish_CFB_NoPadding_Test
14:44:03,889 WARN [main][KeyStore] getMasterKey: Unknown userName: marco
14:44:03,891 INFO [main][KeyStore] getKeySize: System property 'cumulus4j.KeyStore.keySize' is not set. Using default key size (256 bit).
14:44:03,891 INFO [main][KeyStore] createUser: Created master-key with a size of 256 bits. This key will not be modified for this key-store anymore.
14:44:03,891 INFO [main][KeyStore] getEncryptionAlgorithm: System property 'cumulus4j.KeyStore.encryptionAlgorithm' is set to 'Twofish/CFB/NoPadding'. Using this encryption algorithm.
14:44:03,897 INFO [main][KeyStore] getMACAlgorithm: System property 'cumulus4j.KeyStore.macAlgorithm' is set to 'HMACSHA1'. Using this MAC algorithm.
14:44:03,904 WARN [main][KeyStore] verifyMAC: MAC verification failed! macAlgorithm=HMACSHA1 expectedMAC=9916db041d3171c1386a1a5b3b044b469f255a44 calculatedMAC=d3cfa4250cf137ebccb8610407cf53077453dfd1
14:44:03,904 WARN [main][KeyStore] getMasterKey: Wrong password for user "marco"! MAC verification failed.
14:44:03,906 INFO [main][KeyStore] getKeySize: System property 'cumulus4j.KeyStore.keySize' is not set. Using default key size (256 bit).
14:44:03,906 INFO [main][KeyStore] createUser: Created master-key with a size of 256 bits. This key will not be modified for this key-store anymore.
14:44:03,906 INFO [main][KeyStore] getEncryptionAlgorithm: System property 'cumulus4j.KeyStore.encryptionAlgorithm' is set to 'Twofish/CFB/NoPadding'. Using this encryption algorithm.
14:44:03,912 INFO [main][KeyStore] getMACAlgorithm: System property 'cumulus4j.KeyStore.macAlgorithm' is set to 'HMACSHA1'. Using this MAC algorithm.
14:44:03,918 DEBUG [main][CachedMasterKey] clear: Clearing for userName='marco'.
14:44:03,918 DEBUG [main][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@76d4a117
14:44:03,924 DEBUG [main][CachedMasterKey] clear: Clearing for userName='marco'.
14:44:03,924 DEBUG [main][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@19c29f4
14:44:03,931 DEBUG [main][CachedMasterKey] clear: Clearing for userName='marco'.
14:44:03,931 DEBUG [main][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@338652ff
14:44:03,936 DEBUG [main][CachedMasterKey] clear: Clearing for userName='marco'.
14:44:03,936 DEBUG [main][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@37b2fdc6
14:44:03,943 DEBUG [main][CachedMasterKey] clear: Clearing for userName='marco'.
14:44:03,943 DEBUG [main][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@4832eebb
14:44:03,950 INFO [main][KeyStore] getKeySize: System property 'cumulus4j.KeyStore.keySize' is not set. Using default key size (256 bit).
14:44:03,951 INFO [main][KeyStore] createUser: Created master-key with a size of 256 bits. This key will not be modified for this key-store anymore.
14:44:03,951 INFO [main][KeyStore] getEncryptionAlgorithm: System property 'cumulus4j.KeyStore.encryptionAlgorithm' is set to 'Twofish/CFB/NoPadding'. Using this encryption algorithm.
14:44:03,956 INFO [main][KeyStore] getMACAlgorithm: System property 'cumulus4j.KeyStore.macAlgorithm' is set to 'HMACSHA1'. Using this MAC algorithm.
14:44:03,963 INFO [main][KeyStore] getMACAlgorithm: System property 'cumulus4j.KeyStore.macAlgorithm' is set to 'HMACSHA1'. Using this MAC algorithm.
14:44:03,963 INFO [main][KeyStore] getEncryptionAlgorithm: System property 'cumulus4j.KeyStore.encryptionAlgorithm' is set to 'Twofish/CFB/NoPadding'. Using this encryption algorithm.
14:44:03,964 INFO [main][KeyStore] getKeySize: System property 'cumulus4j.KeyStore.keySize' is not set. Using default key size (256 bit).
14:44:03,973 INFO [main][KeyStore] getKeySize: System property 'cumulus4j.KeyStore.keySize' is not set. Using default key size (256 bit).
14:44:03,973 INFO [main][KeyStore] createUser: Created master-key with a size of 256 bits. This key will not be modified for this key-store anymore.
14:44:03,973 INFO [main][KeyStore] getEncryptionAlgorithm: System property 'cumulus4j.KeyStore.encryptionAlgorithm' is set to 'Twofish/CFB/NoPadding'. Using this encryption algorithm.
14:44:03,979 INFO [main][KeyStore] getMACAlgorithm: System property 'cumulus4j.KeyStore.macAlgorithm' is set to 'HMACSHA1'. Using this MAC algorithm.
14:44:07,319 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@4e021bd
14:44:07,320 DEBUG [Finalizer][CachedMasterKey] clear: Clearing for userName='marco'.
14:44:07,321 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@6346c21b
14:44:07,321 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@6346c21b
14:44:07,321 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@5db533b0
14:44:07,322 DEBUG [Finalizer][CachedMasterKey] clear: Clearing for userName='marco'.
14:44:07,322 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@235497e0
14:44:07,322 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@6bf053f
14:44:07,322 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@76d4a117
14:44:07,323 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@19c29f4
14:44:07,323 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@338652ff
14:44:07,323 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@37b2fdc6
14:44:07,323 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@4832eebb
14:44:07,323 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@235497e0
14:44:07,324 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@66f16e8e
14:44:07,324 DEBUG [Finalizer][CachedMasterKey] clear: Clearing for userName='marco'.
14:44:07,324 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@7491616e
14:44:07,324 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@7491616e
14:44:07,324 DEBUG [Finalizer][CachedMasterKey] clear: Clearing for userName='marco'.
14:44:07,325 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@7493b88b
14:44:07,325 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@7493b88b
14:44:18,515 INFO [KeyStore][KeyStore$ExipreCacheEntryTimerTask] run: KeyStore has been garbage-collected. Removing this ExipreCacheEntryTimerTask.
14:44:19,838 INFO [KeyStore][KeyStore$ExipreCacheEntryTimerTask] run: KeyStore has been garbage-collected. Removing this ExipreCacheEntryTimerTask.
14:44:19,890 INFO [KeyStore][KeyStore$ExipreCacheEntryTimerTask] run: KeyStore has been garbage-collected. Removing this ExipreCacheEntryTimerTask.
14:44:19,948 INFO [KeyStore][KeyStore$ExipreCacheEntryTimerTask] run: KeyStore has been garbage-collected. Removing this ExipreCacheEntryTimerTask.
14:44:19,989 INFO [KeyStore][KeyStore$ExipreCacheEntryTimerTask] run: KeyStore has been garbage-collected. Removing this ExipreCacheEntryTimerTask.
14:44:20,019 INFO [KeyStore][KeyStore$ExipreCacheEntryTimerTask] run: KeyStore has been garbage-collected. Removing this ExipreCacheEntryTimerTask.
14:44:20,039 INFO [KeyStore][KeyStore$ExipreCacheEntryTimerTask] run: KeyStore has been garbage-collected. Removing this ExipreCacheEntryTimerTask.
14:44:20,066 INFO [KeyStore][KeyStore$ExipreCacheEntryTimerTask] run: KeyStore has been garbage-collected. Removing this ExipreCacheEntryTimerTask.
14:44:20,135 DEBUG [KeyStore][KeyStore$ExipreCacheEntryTimerTask] run: 1 users left in cache.
14:44:24,033 INFO [KeyStore][KeyStore$ExipreCacheEntryTimerTask] run: KeyStore has been garbage-collected. Removing this ExipreCacheEntryTimerTask.
14:44:24,058 INFO [KeyStore][KeyStore$ExipreCacheEntryTimerTask] run: KeyStore has been garbage-collected. Removing this ExipreCacheEntryTimerTask.
14:44:24,070 INFO [KeyStore][KeyStore$ExipreCacheEntryTimerTask] run: KeyStore has been garbage-collected. Removing this ExipreCacheEntryTimerTask.
14:44:24,080 INFO [KeyStore][KeyStore$ExipreCacheEntryTimerTask] run: KeyStore has been garbage-collected. Removing this ExipreCacheEntryTimerTask.
14:44:24,096 INFO [KeyStore][KeyStore$ExipreCacheEntryTimerTask] run: KeyStore has been garbage-collected. Removing this ExipreCacheEntryTimerTask.
14:44:24,124 INFO [KeyStore][KeyStore$ExipreCacheEntryTimerTask] run: KeyStore has been garbage-collected. Removing this ExipreCacheEntryTimerTask.
14:44:24,153 INFO [KeyStore][KeyStore$ExipreCacheEntryTimerTask] run: KeyStore has been garbage-collected. Removing this ExipreCacheEntryTimerTask.
14:44:24,181 INFO [KeyStore][KeyStore$ExipreCacheEntryTimerTask] run: KeyStore has been garbage-collected. Removing this ExipreCacheEntryTimerTask.
14:44:24,225 INFO [KeyStore][KeyStore$ExipreCacheEntryTimerTask] run: KeyStore has been garbage-collected. Removing this ExipreCacheEntryTimerTask.
14:44:24,279 INFO [KeyStore][KeyStore$ExipreCacheEntryTimerTask] run: KeyStore has been garbage-collected. Removing this ExipreCacheEntryTimerTask.
14:44:24,282 INFO [KeyStore][KeyStore$ExipreCacheEntryTimerTask] run: KeyStore has been garbage-collected. Removing this ExipreCacheEntryTimerTask.
14:44:24,306 INFO [KeyStore][KeyStore$ExipreCacheEntryTimerTask] run: KeyStore has been garbage-collected. Removing this ExipreCacheEntryTimerTask.
14:44:24,367 INFO [KeyStore][KeyStore$ExipreCacheEntryTimerTask] run: KeyStore has been garbage-collected. Removing this ExipreCacheEntryTimerTask.
14:44:24,376 INFO [KeyStore][KeyStore$ExipreCacheEntryTimerTask] run: KeyStore has been garbage-collected. Removing this ExipreCacheEntryTimerTask.
14:44:24,386 INFO [KeyStore][KeyStore$ExipreCacheEntryTimerTask] run: KeyStore has been garbage-collected. Removing this ExipreCacheEntryTimerTask.
14:44:24,396 DEBUG [KeyStore][KeyStore$ExipreCacheEntryTimerTask] run: 1 users left in cache.
14:44:34,333 INFO [main][KeyStoreKeyTest] generateAndReadManyKeysIndividually: firstKeyID=1 lastKeyID=5000
14:44:34,695 INFO [main][KeyStoreKeyTest] generateAndReadManyKeysIndividually (5000 keys):
00.generateManyKeysIndividually invocationCount=1
recursionLevel=0 invocationCount=1 accumulatedTime=30353 minTime=30353 maxTime=30353
05.generateOneKey invocationCount=5000
recursionLevel=0 invocationCount=5000 accumulatedTime=30283 minTime=0 maxTime=79
07.readKeyStore invocationCount=1
recursionLevel=0 invocationCount=1 accumulatedTime=16 minTime=16 maxTime=16
10.readManyKeys invocationCount=1
recursionLevel=0 invocationCount=1 accumulatedTime=346 minTime=346 maxTime=346
14:44:34,698 INFO [main][KeyStore] getKeySize: System property 'cumulus4j.KeyStore.keySize' is not set. Using default key size (256 bit).
14:44:34,698 INFO [main][KeyStore] createUser: Created master-key with a size of 256 bits. This key will not be modified for this key-store anymore.
14:44:34,698 INFO [main][KeyStore] getEncryptionAlgorithm: System property 'cumulus4j.KeyStore.encryptionAlgorithm' is set to 'Twofish/CFB/NoPadding'. Using this encryption algorithm.
14:44:34,704 INFO [main][KeyStore] getMACAlgorithm: System property 'cumulus4j.KeyStore.macAlgorithm' is set to 'HMACSHA1'. Using this MAC algorithm.
14:44:34,901 DEBUG [Finalizer][CachedMasterKey] clear: Clearing for userName='marco'.
14:44:34,905 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@7f571924
14:44:34,906 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@7f571924
14:44:34,906 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@2f33cbcc
14:44:42,938 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@53f39660
14:44:42,939 DEBUG [Finalizer][CachedMasterKey] clear: Clearing for userName='marco'.
14:44:42,939 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@53f39660
14:44:42,939 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@77ad4513
14:44:42,940 DEBUG [Finalizer][CachedMasterKey] clear: Clearing for userName='marco'.
14:44:42,940 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@77ad4513
14:44:42,940 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@10921fc7
14:44:42,940 DEBUG [Finalizer][CachedMasterKey] clear: Clearing for userName='marco'.
14:44:42,941 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@10921fc7
14:44:42,941 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@374b003e
14:44:42,941 DEBUG [Finalizer][CachedMasterKey] clear: Clearing for userName='marco'.
14:44:42,941 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@374b003e
14:44:46,512 INFO [main][KeyStoreKeyTest] generateAndReadManyKeysBulk (35000 keys):
00.generateManyKeysBulk invocationCount=1
recursionLevel=0 invocationCount=1 accumulatedTime=9265 minTime=9265 maxTime=9265
07.readKeyStore invocationCount=1
recursionLevel=0 invocationCount=1 accumulatedTime=105 minTime=105 maxTime=105
10.readManyKeys invocationCount=1
recursionLevel=0 invocationCount=1 accumulatedTime=2421 minTime=2421 maxTime=2421
Tests run: 6, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 42.635 sec
Running org.cumulus4j.keystore.test.KeyStoreCompatibilityTest
14:44:46,526 INFO [main][KeyStore] getKeySize: System property 'cumulus4j.KeyStore.keySize' is not set. Using default key size (256 bit).
14:44:46,526 INFO [main][KeyStore] createUser: Created master-key with a size of 256 bits. This key will not be modified for this key-store anymore.
14:44:46,527 INFO [main][KeyStore] getEncryptionAlgorithm: System property 'cumulus4j.KeyStore.encryptionAlgorithm' is not set. Using default algorithm 'Twofish/GCM/NoPadding'.
14:44:46,532 INFO [main][KeyStore] getMACAlgorithm: System property 'cumulus4j.KeyStore.macAlgorithm' is not set. Using default MAC algorithm 'NONE'.
14:44:46,908 INFO [main][KeyStore] getKeySize: System property 'cumulus4j.KeyStore.keySize' is set to 128 bit. Using this key size.
14:44:46,908 INFO [main][KeyStore] createUser: Created master-key with a size of 128 bits. This key will not be modified for this key-store anymore.
14:44:46,908 INFO [main][KeyStore] getEncryptionAlgorithm: System property 'cumulus4j.KeyStore.encryptionAlgorithm' is set to 'AES/CFB/NoPadding'. Using this encryption algorithm.
14:44:46,911 INFO [main][KeyStore] getMACAlgorithm: System property 'cumulus4j.KeyStore.macAlgorithm' is set to 'HMAC/SHA1'. Using this MAC algorithm.
14:44:47,079 INFO [main][KeyStore] getKeySize: System property 'cumulus4j.KeyStore.keySize' is set to 128 bit. Using this key size.
14:44:47,079 INFO [main][KeyStore] createUser: Created master-key with a size of 128 bits. This key will not be modified for this key-store anymore.
14:44:47,079 INFO [main][KeyStore] getEncryptionAlgorithm: System property 'cumulus4j.KeyStore.encryptionAlgorithm' is set to 'AES/CBC/PKCS5Padding'. Using this encryption algorithm.
14:44:47,082 INFO [main][KeyStore] getMACAlgorithm: System property 'cumulus4j.KeyStore.macAlgorithm' is set to 'HMAC/SHA1'. Using this MAC algorithm.
14:44:47,239 INFO [main][KeyStore] getKeySize: System property 'cumulus4j.KeyStore.keySize' is set to 256 bit. Using this key size.
14:44:47,239 INFO [main][KeyStore] createUser: Created master-key with a size of 256 bits. This key will not be modified for this key-store anymore.
14:44:47,239 INFO [main][KeyStore] getEncryptionAlgorithm: System property 'cumulus4j.KeyStore.encryptionAlgorithm' is set to 'AES/CFB/NoPadding'. Using this encryption algorithm.
14:44:47,245 INFO [main][KeyStore] getMACAlgorithm: System property 'cumulus4j.KeyStore.macAlgorithm' is set to 'HMAC/SHA1'. Using this MAC algorithm.
14:44:47,427 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@5295c398
14:44:47,427 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@665c5a83
14:44:47,427 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@393a82f5
14:44:47,428 DEBUG [Finalizer][CachedMasterKey] clear: Clearing for userName='marco'.
14:44:47,428 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@665c5a83
14:44:47,428 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@7215e330
14:44:47,428 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@7af69ed3
14:44:47,430 DEBUG [Finalizer][CachedMasterKey] clear: Clearing for userName='marco'.
14:44:47,431 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@7215e330
14:44:47,431 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@26b5f36e
14:44:47,431 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@7380ce9c
14:44:47,439 DEBUG [Finalizer][CachedMasterKey] clear: Clearing for userName='marco'.
14:44:47,439 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@26b5f36e
14:44:47,510 INFO [main][KeyStore] getKeySize: System property 'cumulus4j.KeyStore.keySize' is set to 256 bit. Using this key size.
14:44:47,510 INFO [main][KeyStore] createUser: Created master-key with a size of 256 bits. This key will not be modified for this key-store anymore.
14:44:47,515 INFO [main][KeyStore] getEncryptionAlgorithm: System property 'cumulus4j.KeyStore.encryptionAlgorithm' is set to 'AES/CBC/PKCS5Padding'. Using this encryption algorithm.
14:44:47,521 INFO [main][KeyStore] getMACAlgorithm: System property 'cumulus4j.KeyStore.macAlgorithm' is set to 'HMAC/SHA1'. Using this MAC algorithm.
14:44:47,696 INFO [main][KeyStore] getKeySize: System property 'cumulus4j.KeyStore.keySize' is set to 128 bit. Using this key size.
14:44:47,696 INFO [main][KeyStore] createUser: Created master-key with a size of 128 bits. This key will not be modified for this key-store anymore.
14:44:47,696 INFO [main][KeyStore] getEncryptionAlgorithm: System property 'cumulus4j.KeyStore.encryptionAlgorithm' is set to 'Twofish/CFB/NoPadding'. Using this encryption algorithm.
14:44:47,699 INFO [main][KeyStore] getMACAlgorithm: System property 'cumulus4j.KeyStore.macAlgorithm' is set to 'HMAC/SHA1'. Using this MAC algorithm.
14:44:47,941 INFO [main][KeyStore] getKeySize: System property 'cumulus4j.KeyStore.keySize' is set to 128 bit. Using this key size.
14:44:47,941 INFO [main][KeyStore] createUser: Created master-key with a size of 128 bits. This key will not be modified for this key-store anymore.
14:44:47,942 INFO [main][KeyStore] getEncryptionAlgorithm: System property 'cumulus4j.KeyStore.encryptionAlgorithm' is set to 'Twofish/CBC/PKCS5Padding'. Using this encryption algorithm.
14:44:47,945 INFO [main][KeyStore] getMACAlgorithm: System property 'cumulus4j.KeyStore.macAlgorithm' is set to 'HMAC/SHA1'. Using this MAC algorithm.
14:44:48,291 INFO [main][KeyStore] getKeySize: System property 'cumulus4j.KeyStore.keySize' is set to 256 bit. Using this key size.
14:44:48,292 INFO [main][KeyStore] createUser: Created master-key with a size of 256 bits. This key will not be modified for this key-store anymore.
14:44:48,292 INFO [main][KeyStore] getEncryptionAlgorithm: System property 'cumulus4j.KeyStore.encryptionAlgorithm' is set to 'Twofish/CFB/NoPadding'. Using this encryption algorithm.
14:44:48,297 INFO [main][KeyStore] getMACAlgorithm: System property 'cumulus4j.KeyStore.macAlgorithm' is set to 'HMAC/SHA1'. Using this MAC algorithm.
14:44:48,581 INFO [main][KeyStore] getKeySize: System property 'cumulus4j.KeyStore.keySize' is set to 256 bit. Using this key size.
14:44:48,581 INFO [main][KeyStore] createUser: Created master-key with a size of 256 bits. This key will not be modified for this key-store anymore.
14:44:48,581 INFO [main][KeyStore] getEncryptionAlgorithm: System property 'cumulus4j.KeyStore.encryptionAlgorithm' is set to 'Twofish/CBC/PKCS5Padding'. Using this encryption algorithm.
14:44:48,587 INFO [main][KeyStore] getMACAlgorithm: System property 'cumulus4j.KeyStore.macAlgorithm' is set to 'HMAC/SHA1'. Using this MAC algorithm.
14:44:48,948 INFO [main][KeyStoreCompatibilityTest] openReferenceKeystore: Reference-KeyStore was successfully opened.
14:44:48,948 INFO [main][KeyStore] getMACAlgorithm: System property 'cumulus4j.KeyStore.macAlgorithm' is not set. Using default MAC algorithm 'NONE'.
14:44:48,948 INFO [main][KeyStore] getEncryptionAlgorithm: System property 'cumulus4j.KeyStore.encryptionAlgorithm' is not set. Using default algorithm 'Twofish/GCM/NoPadding'.
14:44:48,948 INFO [main][KeyStore] getKeySize: System property 'cumulus4j.KeyStore.keySize' is not set. Using default key size (256 bit).
14:44:48,951 INFO [main][KeyStoreCompatibilityTest] openReferenceKeystore: New key was successfully generated.
14:44:48,958 INFO [main][KeyStoreCompatibilityTest] openReferenceKeystore: Reference-KeyStore was successfully opened.
14:44:48,959 INFO [main][KeyStore] getMACAlgorithm: System property 'cumulus4j.KeyStore.macAlgorithm' is set to 'HMAC/SHA1'. Using this MAC algorithm.
14:44:48,959 INFO [main][KeyStore] getEncryptionAlgorithm: System property 'cumulus4j.KeyStore.encryptionAlgorithm' is set to 'AES/CFB/NoPadding'. Using this encryption algorithm.
14:44:48,959 INFO [main][KeyStore] getKeySize: System property 'cumulus4j.KeyStore.keySize' is set to 128 bit. Using this key size.
14:44:48,961 INFO [main][KeyStoreCompatibilityTest] openReferenceKeystore: New key was successfully generated.
14:44:48,969 INFO [main][KeyStoreCompatibilityTest] openReferenceKeystore: Reference-KeyStore was successfully opened.
14:44:48,969 INFO [main][KeyStore] getMACAlgorithm: System property 'cumulus4j.KeyStore.macAlgorithm' is set to 'HMAC/SHA1'. Using this MAC algorithm.
14:44:48,970 INFO [main][KeyStore] getEncryptionAlgorithm: System property 'cumulus4j.KeyStore.encryptionAlgorithm' is set to 'AES/CBC/PKCS5Padding'. Using this encryption algorithm.
14:44:48,970 INFO [main][KeyStore] getKeySize: System property 'cumulus4j.KeyStore.keySize' is set to 128 bit. Using this key size.
14:44:48,972 INFO [main][KeyStoreCompatibilityTest] openReferenceKeystore: New key was successfully generated.
14:44:48,982 INFO [main][KeyStoreCompatibilityTest] openReferenceKeystore: Reference-KeyStore was successfully opened.
14:44:48,983 INFO [main][KeyStore] getMACAlgorithm: System property 'cumulus4j.KeyStore.macAlgorithm' is set to 'HMAC/SHA1'. Using this MAC algorithm.
14:44:48,983 INFO [main][KeyStore] getEncryptionAlgorithm: System property 'cumulus4j.KeyStore.encryptionAlgorithm' is set to 'AES/CFB/NoPadding'. Using this encryption algorithm.
14:44:48,983 INFO [main][KeyStore] getKeySize: System property 'cumulus4j.KeyStore.keySize' is set to 256 bit. Using this key size.
14:44:48,985 INFO [main][KeyStoreCompatibilityTest] openReferenceKeystore: New key was successfully generated.
14:44:48,996 INFO [main][KeyStoreCompatibilityTest] openReferenceKeystore: Reference-KeyStore was successfully opened.
14:44:48,996 INFO [main][KeyStore] getMACAlgorithm: System property 'cumulus4j.KeyStore.macAlgorithm' is set to 'HMAC/SHA1'. Using this MAC algorithm.
14:44:48,996 INFO [main][KeyStore] getEncryptionAlgorithm: System property 'cumulus4j.KeyStore.encryptionAlgorithm' is set to 'AES/CBC/PKCS5Padding'. Using this encryption algorithm.
14:44:48,996 INFO [main][KeyStore] getKeySize: System property 'cumulus4j.KeyStore.keySize' is set to 256 bit. Using this key size.
14:44:48,999 INFO [main][KeyStoreCompatibilityTest] openReferenceKeystore: New key was successfully generated.
14:44:49,006 INFO [main][KeyStoreCompatibilityTest] openReferenceKeystore: Reference-KeyStore was successfully opened.
14:44:49,006 INFO [main][KeyStore] getMACAlgorithm: System property 'cumulus4j.KeyStore.macAlgorithm' is set to 'HMAC/SHA1'. Using this MAC algorithm.
14:44:49,007 INFO [main][KeyStore] getEncryptionAlgorithm: System property 'cumulus4j.KeyStore.encryptionAlgorithm' is set to 'Twofish/CFB/NoPadding'. Using this encryption algorithm.
14:44:49,007 INFO [main][KeyStore] getKeySize: System property 'cumulus4j.KeyStore.keySize' is set to 128 bit. Using this key size.
14:44:49,009 INFO [main][KeyStoreCompatibilityTest] openReferenceKeystore: New key was successfully generated.
14:44:49,017 INFO [main][KeyStoreCompatibilityTest] openReferenceKeystore: Reference-KeyStore was successfully opened.
14:44:49,017 INFO [main][KeyStore] getMACAlgorithm: System property 'cumulus4j.KeyStore.macAlgorithm' is set to 'HMAC/SHA1'. Using this MAC algorithm.
14:44:49,017 INFO [main][KeyStore] getEncryptionAlgorithm: System property 'cumulus4j.KeyStore.encryptionAlgorithm' is set to 'Twofish/CBC/PKCS5Padding'. Using this encryption algorithm.
14:44:49,018 INFO [main][KeyStore] getKeySize: System property 'cumulus4j.KeyStore.keySize' is set to 128 bit. Using this key size.
14:44:49,020 INFO [main][KeyStoreCompatibilityTest] openReferenceKeystore: New key was successfully generated.
14:44:49,030 INFO [main][KeyStoreCompatibilityTest] openReferenceKeystore: Reference-KeyStore was successfully opened.
14:44:49,030 INFO [main][KeyStore] getMACAlgorithm: System property 'cumulus4j.KeyStore.macAlgorithm' is set to 'HMAC/SHA1'. Using this MAC algorithm.
14:44:49,032 INFO [main][KeyStore] getEncryptionAlgorithm: System property 'cumulus4j.KeyStore.encryptionAlgorithm' is set to 'Twofish/CFB/NoPadding'. Using this encryption algorithm.
14:44:49,032 INFO [main][KeyStore] getKeySize: System property 'cumulus4j.KeyStore.keySize' is set to 256 bit. Using this key size.
14:44:49,034 INFO [main][KeyStoreCompatibilityTest] openReferenceKeystore: New key was successfully generated.
14:44:49,045 INFO [main][KeyStoreCompatibilityTest] openReferenceKeystore: Reference-KeyStore was successfully opened.
14:44:49,045 INFO [main][KeyStore] getMACAlgorithm: System property 'cumulus4j.KeyStore.macAlgorithm' is set to 'HMAC/SHA1'. Using this MAC algorithm.
14:44:49,045 INFO [main][KeyStore] getEncryptionAlgorithm: System property 'cumulus4j.KeyStore.encryptionAlgorithm' is set to 'Twofish/CBC/PKCS5Padding'. Using this encryption algorithm.
14:44:49,046 INFO [main][KeyStore] getKeySize: System property 'cumulus4j.KeyStore.keySize' is set to 256 bit. Using this key size.
14:44:49,048 INFO [main][KeyStoreCompatibilityTest] openReferenceKeystore: New key was successfully generated.
14:44:49,059 INFO [main][KeyStoreCompatibilityTest] openReferenceKeystore: Reference-KeyStore was successfully opened.
14:44:49,059 INFO [main][KeyStore] getMACAlgorithm: System property 'cumulus4j.KeyStore.macAlgorithm' is not set. Using default MAC algorithm 'NONE'.
14:44:49,059 INFO [main][KeyStore] getEncryptionAlgorithm: System property 'cumulus4j.KeyStore.encryptionAlgorithm' is not set. Using default algorithm 'Twofish/GCM/NoPadding'.
14:44:49,059 INFO [main][KeyStore] getKeySize: System property 'cumulus4j.KeyStore.keySize' is not set. Using default key size (256 bit).
14:44:49,062 INFO [main][KeyStoreCompatibilityTest] openReferenceKeystore: New key was successfully generated.
14:44:49,069 INFO [main][KeyStoreCompatibilityTest] openReferenceKeystore: Reference-KeyStore was successfully opened.
14:44:49,069 INFO [main][KeyStore] getMACAlgorithm: System property 'cumulus4j.KeyStore.macAlgorithm' is set to 'HMAC/SHA1'. Using this MAC algorithm.
14:44:49,069 INFO [main][KeyStore] getEncryptionAlgorithm: System property 'cumulus4j.KeyStore.encryptionAlgorithm' is set to 'AES/CFB/NoPadding'. Using this encryption algorithm.
14:44:49,070 INFO [main][KeyStore] getKeySize: System property 'cumulus4j.KeyStore.keySize' is set to 128 bit. Using this key size.
14:44:49,072 INFO [main][KeyStoreCompatibilityTest] openReferenceKeystore: New key was successfully generated.
14:44:49,079 INFO [main][KeyStoreCompatibilityTest] openReferenceKeystore: Reference-KeyStore was successfully opened.
14:44:49,080 INFO [main][KeyStore] getMACAlgorithm: System property 'cumulus4j.KeyStore.macAlgorithm' is set to 'HMAC/SHA1'. Using this MAC algorithm.
14:44:49,080 INFO [main][KeyStore] getEncryptionAlgorithm: System property 'cumulus4j.KeyStore.encryptionAlgorithm' is set to 'AES/CBC/PKCS5Padding'. Using this encryption algorithm.
14:44:49,080 INFO [main][KeyStore] getKeySize: System property 'cumulus4j.KeyStore.keySize' is set to 128 bit. Using this key size.
14:44:49,082 INFO [main][KeyStoreCompatibilityTest] openReferenceKeystore: New key was successfully generated.
14:44:49,092 INFO [main][KeyStoreCompatibilityTest] openReferenceKeystore: Reference-KeyStore was successfully opened.
14:44:49,093 INFO [main][KeyStore] getMACAlgorithm: System property 'cumulus4j.KeyStore.macAlgorithm' is set to 'HMAC/SHA1'. Using this MAC algorithm.
14:44:49,093 INFO [main][KeyStore] getEncryptionAlgorithm: System property 'cumulus4j.KeyStore.encryptionAlgorithm' is set to 'AES/CFB/NoPadding'. Using this encryption algorithm.
14:44:49,093 INFO [main][KeyStore] getKeySize: System property 'cumulus4j.KeyStore.keySize' is set to 256 bit. Using this key size.
14:44:49,095 INFO [main][KeyStoreCompatibilityTest] openReferenceKeystore: New key was successfully generated.
14:44:49,106 INFO [main][KeyStoreCompatibilityTest] openReferenceKeystore: Reference-KeyStore was successfully opened.
14:44:49,106 INFO [main][KeyStore] getMACAlgorithm: System property 'cumulus4j.KeyStore.macAlgorithm' is set to 'HMAC/SHA1'. Using this MAC algorithm.
14:44:49,106 INFO [main][KeyStore] getEncryptionAlgorithm: System property 'cumulus4j.KeyStore.encryptionAlgorithm' is set to 'AES/CBC/PKCS5Padding'. Using this encryption algorithm.
14:44:49,106 INFO [main][KeyStore] getKeySize: System property 'cumulus4j.KeyStore.keySize' is set to 256 bit. Using this key size.
14:44:49,109 INFO [main][KeyStoreCompatibilityTest] openReferenceKeystore: New key was successfully generated.
14:44:49,116 INFO [main][KeyStoreCompatibilityTest] openReferenceKeystore: Reference-KeyStore was successfully opened.
14:44:49,116 INFO [main][KeyStore] getMACAlgorithm: System property 'cumulus4j.KeyStore.macAlgorithm' is set to 'HMAC/SHA1'. Using this MAC algorithm.
14:44:49,117 INFO [main][KeyStore] getEncryptionAlgorithm: System property 'cumulus4j.KeyStore.encryptionAlgorithm' is set to 'Twofish/CFB/NoPadding'. Using this encryption algorithm.
14:44:49,117 INFO [main][KeyStore] getKeySize: System property 'cumulus4j.KeyStore.keySize' is set to 128 bit. Using this key size.
14:44:49,119 INFO [main][KeyStoreCompatibilityTest] openReferenceKeystore: New key was successfully generated.
14:44:49,127 INFO [main][KeyStoreCompatibilityTest] openReferenceKeystore: Reference-KeyStore was successfully opened.
14:44:49,127 INFO [main][KeyStore] getMACAlgorithm: System property 'cumulus4j.KeyStore.macAlgorithm' is set to 'HMAC/SHA1'. Using this MAC algorithm.
14:44:49,127 INFO [main][KeyStore] getEncryptionAlgorithm: System property 'cumulus4j.KeyStore.encryptionAlgorithm' is set to 'Twofish/CBC/PKCS5Padding'. Using this encryption algorithm.
14:44:49,127 INFO [main][KeyStore] getKeySize: System property 'cumulus4j.KeyStore.keySize' is set to 128 bit. Using this key size.
14:44:49,130 INFO [main][KeyStoreCompatibilityTest] openReferenceKeystore: New key was successfully generated.
14:44:49,140 INFO [main][KeyStoreCompatibilityTest] openReferenceKeystore: Reference-KeyStore was successfully opened.
14:44:49,140 INFO [main][KeyStore] getMACAlgorithm: System property 'cumulus4j.KeyStore.macAlgorithm' is set to 'HMAC/SHA1'. Using this MAC algorithm.
14:44:49,140 INFO [main][KeyStore] getEncryptionAlgorithm: System property 'cumulus4j.KeyStore.encryptionAlgorithm' is set to 'Twofish/CFB/NoPadding'. Using this encryption algorithm.
14:44:49,140 INFO [main][KeyStore] getKeySize: System property 'cumulus4j.KeyStore.keySize' is set to 256 bit. Using this key size.
14:44:49,143 INFO [main][KeyStoreCompatibilityTest] openReferenceKeystore: New key was successfully generated.
14:44:49,154 INFO [main][KeyStoreCompatibilityTest] openReferenceKeystore: Reference-KeyStore was successfully opened.
14:44:49,154 INFO [main][KeyStore] getMACAlgorithm: System property 'cumulus4j.KeyStore.macAlgorithm' is set to 'HMAC/SHA1'. Using this MAC algorithm.
14:44:49,154 INFO [main][KeyStore] getEncryptionAlgorithm: System property 'cumulus4j.KeyStore.encryptionAlgorithm' is set to 'Twofish/CBC/PKCS5Padding'. Using this encryption algorithm.
14:44:49,155 INFO [main][KeyStore] getKeySize: System property 'cumulus4j.KeyStore.keySize' is set to 256 bit. Using this key size.
14:44:49,157 INFO [main][KeyStoreCompatibilityTest] openReferenceKeystore: New key was successfully generated.
Tests run: 2, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 2.636 sec
Running org.cumulus4j.keystore.test.KeyStoreKeyTest
14:44:49,171 WARN [main][KeyStore] getMasterKey: Unknown userName: marco
14:44:49,174 INFO [main][KeyStore] getKeySize: System property 'cumulus4j.KeyStore.keySize' is not set. Using default key size (256 bit).
14:44:49,175 INFO [main][KeyStore] createUser: Created master-key with a size of 256 bits. This key will not be modified for this key-store anymore.
14:44:49,175 INFO [main][KeyStore] getEncryptionAlgorithm: System property 'cumulus4j.KeyStore.encryptionAlgorithm' is not set. Using default algorithm 'Twofish/GCM/NoPadding'.
14:44:49,180 INFO [main][KeyStore] getMACAlgorithm: System property 'cumulus4j.KeyStore.macAlgorithm' is not set. Using default MAC algorithm 'NONE'.
14:44:49,186 WARN [main][KeyStore] getMasterKey: Caught CryptoException indicating a wrong password for user "marco"!
14:44:49,186 WARN [main][KeyStore] getMasterKey: Wrong password for user "marco"! MAC verification failed.
14:44:49,188 INFO [main][KeyStore] getKeySize: System property 'cumulus4j.KeyStore.keySize' is not set. Using default key size (256 bit).
14:44:49,188 INFO [main][KeyStore] createUser: Created master-key with a size of 256 bits. This key will not be modified for this key-store anymore.
14:44:49,189 INFO [main][KeyStore] getEncryptionAlgorithm: System property 'cumulus4j.KeyStore.encryptionAlgorithm' is not set. Using default algorithm 'Twofish/GCM/NoPadding'.
14:44:49,194 INFO [main][KeyStore] getMACAlgorithm: System property 'cumulus4j.KeyStore.macAlgorithm' is not set. Using default MAC algorithm 'NONE'.
14:44:49,200 DEBUG [main][CachedMasterKey] clear: Clearing for userName='marco'.
14:44:49,200 DEBUG [main][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@77ed2fe7
14:44:49,206 DEBUG [main][CachedMasterKey] clear: Clearing for userName='marco'.
14:44:49,206 DEBUG [main][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@74e42433
14:44:49,212 DEBUG [main][CachedMasterKey] clear: Clearing for userName='marco'.
14:44:49,212 DEBUG [main][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@2e04cc39
14:44:49,217 DEBUG [main][CachedMasterKey] clear: Clearing for userName='marco'.
14:44:49,217 DEBUG [main][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@3cfbc9c9
14:44:49,224 DEBUG [main][CachedMasterKey] clear: Clearing for userName='marco'.
14:44:49,224 DEBUG [main][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@367cca66
14:44:49,232 INFO [main][KeyStore] getKeySize: System property 'cumulus4j.KeyStore.keySize' is not set. Using default key size (256 bit).
14:44:49,232 INFO [main][KeyStore] createUser: Created master-key with a size of 256 bits. This key will not be modified for this key-store anymore.
14:44:49,233 INFO [main][KeyStore] getEncryptionAlgorithm: System property 'cumulus4j.KeyStore.encryptionAlgorithm' is not set. Using default algorithm 'Twofish/GCM/NoPadding'.
14:44:49,238 INFO [main][KeyStore] getMACAlgorithm: System property 'cumulus4j.KeyStore.macAlgorithm' is not set. Using default MAC algorithm 'NONE'.
14:44:49,244 INFO [main][KeyStore] getMACAlgorithm: System property 'cumulus4j.KeyStore.macAlgorithm' is not set. Using default MAC algorithm 'NONE'.
14:44:49,244 INFO [main][KeyStore] getEncryptionAlgorithm: System property 'cumulus4j.KeyStore.encryptionAlgorithm' is not set. Using default algorithm 'Twofish/GCM/NoPadding'.
14:44:49,245 INFO [main][KeyStore] getKeySize: System property 'cumulus4j.KeyStore.keySize' is not set. Using default key size (256 bit).
14:44:49,254 INFO [main][KeyStore] getKeySize: System property 'cumulus4j.KeyStore.keySize' is not set. Using default key size (256 bit).
14:44:49,254 INFO [main][KeyStore] createUser: Created master-key with a size of 256 bits. This key will not be modified for this key-store anymore.
14:44:49,254 INFO [main][KeyStore] getEncryptionAlgorithm: System property 'cumulus4j.KeyStore.encryptionAlgorithm' is not set. Using default algorithm 'Twofish/GCM/NoPadding'.
14:44:49,260 INFO [main][KeyStore] getMACAlgorithm: System property 'cumulus4j.KeyStore.macAlgorithm' is not set. Using default MAC algorithm 'NONE'.
14:44:50,406 DEBUG [Finalizer][CachedMasterKey] clear: Clearing for userName='marco'.
14:44:50,406 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@489456cd
14:44:50,406 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@2ced1f5
14:44:50,406 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@489456cd
14:44:50,407 DEBUG [Finalizer][CachedMasterKey] clear: Clearing for userName='marco'.
14:44:50,407 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@5371b6f5
14:44:50,408 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@4ea2b99f
14:44:50,408 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@5371b6f5
14:44:50,409 DEBUG [Finalizer][CachedMasterKey] clear: Clearing for userName='marco'.
14:44:50,409 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@a80b827
14:44:50,409 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@8ba0dd4
14:44:50,409 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@a80b827
14:44:50,410 DEBUG [Finalizer][CachedMasterKey] clear: Clearing for userName='marco'.
14:44:50,410 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@2ea6e962
14:44:50,410 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@502438db
14:44:50,411 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@2ea6e962
14:44:50,411 DEBUG [Finalizer][CachedMasterKey] clear: Clearing for userName='marco'.
14:44:50,411 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@6897ccbc
14:44:50,412 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@46028049
14:44:50,412 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@6897ccbc
14:44:50,412 DEBUG [Finalizer][CachedMasterKey] clear: Clearing for userName='marco'.
14:44:50,412 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@4e345c87
14:44:50,412 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@4e345c87
14:44:50,413 DEBUG [Finalizer][CachedMasterKey] clear: Clearing for userName='marco'.
14:44:50,413 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@4f652035
14:44:50,413 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@4f652035
14:44:50,414 DEBUG [Finalizer][CachedMasterKey] clear: Clearing for userName='marco'.
14:44:50,414 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@6e3ed98c
14:44:50,415 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@6e3ed98c
14:44:50,415 DEBUG [Finalizer][CachedMasterKey] clear: Clearing for userName='marco'.
14:44:50,415 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@2ffce3d5
14:44:50,416 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@2ffce3d5
14:44:50,416 DEBUG [Finalizer][CachedMasterKey] clear: Clearing for userName='marco'.
14:44:50,416 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@430eaae5
14:44:50,417 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@430eaae5
14:44:50,417 DEBUG [Finalizer][CachedMasterKey] clear: Clearing for userName='marco'.
14:44:50,417 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@77f5c2c7
14:44:50,417 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@77f5c2c7
14:44:50,417 DEBUG [Finalizer][CachedMasterKey] clear: Clearing for userName='marco'.
14:44:50,418 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@27c6d458
14:44:50,418 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@27c6d458
14:44:50,418 DEBUG [Finalizer][CachedMasterKey] clear: Clearing for userName='marco'.
14:44:50,418 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@6e9ef1ce
14:44:50,418 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@6e9ef1ce
14:44:50,419 DEBUG [Finalizer][CachedMasterKey] clear: Clearing for userName='marco'.
14:44:50,419 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@515441f
14:44:50,419 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@515441f
14:44:50,419 DEBUG [Finalizer][CachedMasterKey] clear: Clearing for userName='marco'.
14:44:50,419 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@372b51d4
14:44:50,420 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@372b51d4
14:44:50,420 DEBUG [Finalizer][CachedMasterKey] clear: Clearing for userName='marco'.
14:44:50,420 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@7d095197
14:44:50,420 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@7d095197
14:44:50,420 DEBUG [Finalizer][CachedMasterKey] clear: Clearing for userName='marco'.
14:44:50,420 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@6ecbd0a2
14:44:50,421 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@6ecbd0a2
14:44:50,421 DEBUG [Finalizer][CachedMasterKey] clear: Clearing for userName='marco'.
14:44:50,421 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@6ee7482
14:44:50,421 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@6ee7482
14:44:50,421 DEBUG [Finalizer][CachedMasterKey] clear: Clearing for userName='marco'.
14:44:50,422 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@1123065c
14:44:50,422 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@1123065c
14:44:50,422 DEBUG [Finalizer][CachedMasterKey] clear: Clearing for userName='marco'.
14:44:50,422 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@12768ace
14:44:50,422 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@12768ace
14:44:50,423 DEBUG [Finalizer][CachedMasterKey] clear: Clearing for userName='marco'.
14:44:50,423 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@2492e3da
14:44:50,423 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@2492e3da
14:44:50,423 DEBUG [Finalizer][CachedMasterKey] clear: Clearing for userName='marco'.
14:44:50,423 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@27ad0ff8
14:44:50,424 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@27ad0ff8
14:44:50,424 DEBUG [Finalizer][CachedMasterKey] clear: Clearing for userName='marco'.
14:44:50,424 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@52f37721
14:44:50,424 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@52f37721
14:44:50,424 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@6e124212
14:44:50,425 DEBUG [Finalizer][CachedMasterKey] clear: Clearing for userName='marco'.
14:44:50,425 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@70afe432
14:44:50,425 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@2baec86a
14:44:50,425 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@77ed2fe7
14:44:50,425 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@74e42433
14:44:50,426 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@2e04cc39
14:44:50,426 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@3cfbc9c9
14:44:50,426 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@367cca66
14:44:50,426 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@70afe432
14:44:50,426 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@5fe7bd8d
14:44:50,427 DEBUG [Finalizer][CachedMasterKey] clear: Clearing for userName='marco'.
14:44:50,427 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@674da52b
14:44:50,427 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@674da52b
14:44:50,427 DEBUG [Finalizer][CachedMasterKey] clear: Clearing for userName='marco'.
14:44:50,427 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@1a96df09
14:44:50,428 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@1a96df09
14:44:50,428 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@270cd582
14:44:56,875 INFO [KeyStore][KeyStore$ExipreCacheEntryTimerTask] run: KeyStore has been garbage-collected. Removing this ExipreCacheEntryTimerTask.
14:44:57,067 INFO [KeyStore][KeyStore$ExipreCacheEntryTimerTask] run: KeyStore has been garbage-collected. Removing this ExipreCacheEntryTimerTask.
14:45:02,735 INFO [KeyStore][KeyStore$ExipreCacheEntryTimerTask] run: KeyStore has been garbage-collected. Removing this ExipreCacheEntryTimerTask.
14:45:03,889 INFO [KeyStore][KeyStore$ExipreCacheEntryTimerTask] run: KeyStore has been garbage-collected. Removing this ExipreCacheEntryTimerTask.
14:45:03,891 INFO [KeyStore][KeyStore$ExipreCacheEntryTimerTask] run: KeyStore has been garbage-collected. Removing this ExipreCacheEntryTimerTask.
14:45:03,906 INFO [KeyStore][KeyStore$ExipreCacheEntryTimerTask] run: KeyStore has been garbage-collected. Removing this ExipreCacheEntryTimerTask.
14:45:03,950 INFO [KeyStore][KeyStore$ExipreCacheEntryTimerTask] run: KeyStore has been garbage-collected. Removing this ExipreCacheEntryTimerTask.
14:45:03,957 INFO [KeyStore][KeyStore$ExipreCacheEntryTimerTask] run: KeyStore has been garbage-collected. Removing this ExipreCacheEntryTimerTask.
14:45:03,965 INFO [KeyStore][KeyStore$ExipreCacheEntryTimerTask] run: KeyStore has been garbage-collected. Removing this ExipreCacheEntryTimerTask.
14:45:03,973 INFO [KeyStore][KeyStore$ExipreCacheEntryTimerTask] run: KeyStore has been garbage-collected. Removing this ExipreCacheEntryTimerTask.
14:45:14,742 INFO [main][KeyStoreKeyTest] generateAndReadManyKeysIndividually: firstKeyID=1 lastKeyID=5000
14:45:15,317 INFO [main][KeyStoreKeyTest] generateAndReadManyKeysIndividually (5000 keys):
00.generateManyKeysIndividually invocationCount=1
recursionLevel=0 invocationCount=1 accumulatedTime=25482 minTime=25482 maxTime=25482
05.generateOneKey invocationCount=5000
recursionLevel=0 invocationCount=5000 accumulatedTime=25462 minTime=0 maxTime=35
07.readKeyStore invocationCount=1
recursionLevel=0 invocationCount=1 accumulatedTime=14 minTime=14 maxTime=14
10.readManyKeys invocationCount=1
recursionLevel=0 invocationCount=1 accumulatedTime=561 minTime=561 maxTime=561
14:45:15,319 INFO [main][KeyStore] getKeySize: System property 'cumulus4j.KeyStore.keySize' is not set. Using default key size (256 bit).
14:45:15,319 INFO [main][KeyStore] createUser: Created master-key with a size of 256 bits. This key will not be modified for this key-store anymore.
14:45:15,319 INFO [main][KeyStore] getEncryptionAlgorithm: System property 'cumulus4j.KeyStore.encryptionAlgorithm' is not set. Using default algorithm 'Twofish/GCM/NoPadding'.
14:45:15,325 INFO [main][KeyStore] getMACAlgorithm: System property 'cumulus4j.KeyStore.macAlgorithm' is not set. Using default MAC algorithm 'NONE'.
14:45:16,400 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@47b8f42
14:45:20,135 INFO [KeyStore][KeyStore$ExipreCacheEntryTimerTask] run: KeyStore has been garbage-collected. Removing this ExipreCacheEntryTimerTask.
14:45:24,396 INFO [KeyStore][KeyStore$ExipreCacheEntryTimerTask] run: KeyStore has been garbage-collected. Removing this ExipreCacheEntryTimerTask.
14:45:28,988 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@2ad1c003
14:45:28,989 DEBUG [Finalizer][CachedMasterKey] clear: Clearing for userName='marco'.
14:45:28,989 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@2ad1c003
14:45:28,989 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@d1a5338
14:45:28,990 DEBUG [Finalizer][CachedMasterKey] clear: Clearing for userName='marco'.
14:45:28,990 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@d1a5338
14:45:28,990 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@5f2c402a
14:45:28,991 DEBUG [Finalizer][CachedMasterKey] clear: Clearing for userName='marco'.
14:45:28,991 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@5f2c402a
14:45:28,991 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@6ed2bd5d
14:45:28,991 DEBUG [Finalizer][CachedMasterKey] clear: Clearing for userName='marco'.
14:45:28,991 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@6ed2bd5d
14:45:28,991 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@4d8e5d82
14:45:28,992 DEBUG [Finalizer][CachedMasterKey] clear: Clearing for userName='marco'.
14:45:28,992 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@4d8e5d82
14:45:28,992 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@3d9d2995
14:45:28,992 DEBUG [Finalizer][CachedMasterKey] clear: Clearing for userName='marco'.
14:45:28,992 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@3d9d2995
14:45:31,669 INFO [main][KeyStoreKeyTest] generateAndReadManyKeysBulk (35000 keys):
00.generateManyKeysBulk invocationCount=1
recursionLevel=0 invocationCount=1 accumulatedTime=12105 minTime=12105 maxTime=12105
07.readKeyStore invocationCount=1
recursionLevel=0 invocationCount=1 accumulatedTime=127 minTime=127 maxTime=127
10.readManyKeys invocationCount=1
recursionLevel=0 invocationCount=1 accumulatedTime=4093 minTime=4093 maxTime=4093
Tests run: 6, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 42.507 sec
Running org.cumulus4j.keystore.test.KeyStoreKey_Twofish_CBC_PKCS5Padding_Test
14:45:31,684 WARN [main][KeyStore] getMasterKey: Unknown userName: marco
14:45:31,686 INFO [main][KeyStore] getKeySize: System property 'cumulus4j.KeyStore.keySize' is not set. Using default key size (256 bit).
14:45:31,687 INFO [main][KeyStore] createUser: Created master-key with a size of 256 bits. This key will not be modified for this key-store anymore.
14:45:31,687 INFO [main][KeyStore] getEncryptionAlgorithm: System property 'cumulus4j.KeyStore.encryptionAlgorithm' is set to 'Twofish/CBC/PKCS5Padding'. Using this encryption algorithm.
14:45:31,692 INFO [main][KeyStore] getMACAlgorithm: System property 'cumulus4j.KeyStore.macAlgorithm' is set to 'HMACSHA1'. Using this MAC algorithm.
14:45:31,698 WARN [main][KeyStore] getMasterKey: Caught CryptoException indicating a wrong password for user "marco"!
14:45:31,699 WARN [main][KeyStore] getMasterKey: Wrong password for user "marco"! MAC verification failed.
14:45:31,700 INFO [main][KeyStore] getKeySize: System property 'cumulus4j.KeyStore.keySize' is not set. Using default key size (256 bit).
14:45:31,701 INFO [main][KeyStore] createUser: Created master-key with a size of 256 bits. This key will not be modified for this key-store anymore.
14:45:31,701 INFO [main][KeyStore] getEncryptionAlgorithm: System property 'cumulus4j.KeyStore.encryptionAlgorithm' is set to 'Twofish/CBC/PKCS5Padding'. Using this encryption algorithm.
14:45:31,707 INFO [main][KeyStore] getMACAlgorithm: System property 'cumulus4j.KeyStore.macAlgorithm' is set to 'HMACSHA1'. Using this MAC algorithm.
14:45:31,712 DEBUG [main][CachedMasterKey] clear: Clearing for userName='marco'.
14:45:31,713 DEBUG [main][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@1a39a462
14:45:31,718 DEBUG [main][CachedMasterKey] clear: Clearing for userName='marco'.
14:45:31,718 DEBUG [main][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@3e572b61
14:45:31,724 DEBUG [main][CachedMasterKey] clear: Clearing for userName='marco'.
14:45:31,724 DEBUG [main][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@4ce10d40
14:45:31,730 DEBUG [main][CachedMasterKey] clear: Clearing for userName='marco'.
14:45:31,730 DEBUG [main][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@4b2d0c2e
14:45:31,736 DEBUG [main][CachedMasterKey] clear: Clearing for userName='marco'.
14:45:31,736 DEBUG [main][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@7a7ac690
14:45:31,744 INFO [main][KeyStore] getKeySize: System property 'cumulus4j.KeyStore.keySize' is not set. Using default key size (256 bit).
14:45:31,744 INFO [main][KeyStore] createUser: Created master-key with a size of 256 bits. This key will not be modified for this key-store anymore.
14:45:31,744 INFO [main][KeyStore] getEncryptionAlgorithm: System property 'cumulus4j.KeyStore.encryptionAlgorithm' is set to 'Twofish/CBC/PKCS5Padding'. Using this encryption algorithm.
14:45:31,749 INFO [main][KeyStore] getMACAlgorithm: System property 'cumulus4j.KeyStore.macAlgorithm' is set to 'HMACSHA1'. Using this MAC algorithm.
14:45:31,756 INFO [main][KeyStore] getMACAlgorithm: System property 'cumulus4j.KeyStore.macAlgorithm' is set to 'HMACSHA1'. Using this MAC algorithm.
14:45:31,756 INFO [main][KeyStore] getEncryptionAlgorithm: System property 'cumulus4j.KeyStore.encryptionAlgorithm' is set to 'Twofish/CBC/PKCS5Padding'. Using this encryption algorithm.
14:45:31,756 INFO [main][KeyStore] getKeySize: System property 'cumulus4j.KeyStore.keySize' is not set. Using default key size (256 bit).
14:45:31,764 INFO [main][KeyStore] getKeySize: System property 'cumulus4j.KeyStore.keySize' is not set. Using default key size (256 bit).
14:45:31,764 INFO [main][KeyStore] createUser: Created master-key with a size of 256 bits. This key will not be modified for this key-store anymore.
14:45:31,764 INFO [main][KeyStore] getEncryptionAlgorithm: System property 'cumulus4j.KeyStore.encryptionAlgorithm' is set to 'Twofish/CBC/PKCS5Padding'. Using this encryption algorithm.
14:45:31,770 INFO [main][KeyStore] getMACAlgorithm: System property 'cumulus4j.KeyStore.macAlgorithm' is set to 'HMACSHA1'. Using this MAC algorithm.
14:45:34,349 INFO [KeyStore][KeyStore$ExipreCacheEntryTimerTask] run: KeyStore has been garbage-collected. Removing this ExipreCacheEntryTimerTask.
14:45:34,697 INFO [KeyStore][KeyStore$ExipreCacheEntryTimerTask] run: KeyStore has been garbage-collected. Removing this ExipreCacheEntryTimerTask.
14:45:37,363 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@1cf6e5e9
14:45:37,363 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@157032da
14:45:37,364 DEBUG [Finalizer][CachedMasterKey] clear: Clearing for userName='marco'.
14:45:37,364 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@157032da
14:45:37,364 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@3f332b09
14:45:37,365 DEBUG [Finalizer][CachedMasterKey] clear: Clearing for userName='marco'.
14:45:37,365 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@3f332b09
14:45:37,365 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@28c1b980
14:45:37,366 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@58c30f56
14:45:37,366 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@7a7ac690
14:45:37,366 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@4b2d0c2e
14:45:37,367 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@4ce10d40
14:45:37,367 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@3e572b61
14:45:37,367 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@1a39a462
14:45:37,367 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@6e2404a0
14:45:37,368 DEBUG [Finalizer][CachedMasterKey] clear: Clearing for userName='marco'.
14:45:37,368 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@58c30f56
14:45:37,368 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@45317223
14:45:44,091 INFO [KeyStore][KeyStore$ExipreCacheEntryTimerTask] run: KeyStore has been garbage-collected. Removing this ExipreCacheEntryTimerTask.
14:45:46,526 INFO [KeyStore][KeyStore$ExipreCacheEntryTimerTask] run: KeyStore has been garbage-collected. Removing this ExipreCacheEntryTimerTask.
14:45:46,909 INFO [KeyStore][KeyStore$ExipreCacheEntryTimerTask] run: KeyStore has been garbage-collected. Removing this ExipreCacheEntryTimerTask.
14:45:47,079 INFO [KeyStore][KeyStore$ExipreCacheEntryTimerTask] run: KeyStore has been garbage-collected. Removing this ExipreCacheEntryTimerTask.
14:45:47,239 INFO [KeyStore][KeyStore$ExipreCacheEntryTimerTask] run: KeyStore has been garbage-collected. Removing this ExipreCacheEntryTimerTask.
14:45:47,510 INFO [KeyStore][KeyStore$ExipreCacheEntryTimerTask] run: KeyStore has been garbage-collected. Removing this ExipreCacheEntryTimerTask.
14:45:47,696 INFO [KeyStore][KeyStore$ExipreCacheEntryTimerTask] run: KeyStore has been garbage-collected. Removing this ExipreCacheEntryTimerTask.
14:45:47,941 INFO [KeyStore][KeyStore$ExipreCacheEntryTimerTask] run: KeyStore has been garbage-collected. Removing this ExipreCacheEntryTimerTask.
14:45:48,291 INFO [KeyStore][KeyStore$ExipreCacheEntryTimerTask] run: KeyStore has been garbage-collected. Removing this ExipreCacheEntryTimerTask.
14:45:48,581 INFO [KeyStore][KeyStore$ExipreCacheEntryTimerTask] run: KeyStore has been garbage-collected. Removing this ExipreCacheEntryTimerTask.
14:45:48,942 INFO [KeyStore][KeyStore$ExipreCacheEntryTimerTask] run: KeyStore has been garbage-collected. Removing this ExipreCacheEntryTimerTask.
14:45:48,955 INFO [KeyStore][KeyStore$ExipreCacheEntryTimerTask] run: KeyStore has been garbage-collected. Removing this ExipreCacheEntryTimerTask.
14:45:48,966 INFO [KeyStore][KeyStore$ExipreCacheEntryTimerTask] run: KeyStore has been garbage-collected. Removing this ExipreCacheEntryTimerTask.
14:45:48,977 INFO [KeyStore][KeyStore$ExipreCacheEntryTimerTask] run: KeyStore has been garbage-collected. Removing this ExipreCacheEntryTimerTask.
14:45:48,990 INFO [KeyStore][KeyStore$ExipreCacheEntryTimerTask] run: KeyStore has been garbage-collected. Removing this ExipreCacheEntryTimerTask.
14:45:49,003 INFO [KeyStore][KeyStore$ExipreCacheEntryTimerTask] run: KeyStore has been garbage-collected. Removing this ExipreCacheEntryTimerTask.
14:45:49,014 INFO [KeyStore][KeyStore$ExipreCacheEntryTimerTask] run: KeyStore has been garbage-collected. Removing this ExipreCacheEntryTimerTask.
14:45:49,025 INFO [KeyStore][KeyStore$ExipreCacheEntryTimerTask] run: KeyStore has been garbage-collected. Removing this ExipreCacheEntryTimerTask.
14:45:49,039 INFO [KeyStore][KeyStore$ExipreCacheEntryTimerTask] run: KeyStore has been garbage-collected. Removing this ExipreCacheEntryTimerTask.
14:45:49,053 INFO [KeyStore][KeyStore$ExipreCacheEntryTimerTask] run: KeyStore has been garbage-collected. Removing this ExipreCacheEntryTimerTask.
14:45:49,066 INFO [KeyStore][KeyStore$ExipreCacheEntryTimerTask] run: KeyStore has been garbage-collected. Removing this ExipreCacheEntryTimerTask.
14:45:49,077 INFO [KeyStore][KeyStore$ExipreCacheEntryTimerTask] run: KeyStore has been garbage-collected. Removing this ExipreCacheEntryTimerTask.
14:45:49,087 INFO [KeyStore][KeyStore$ExipreCacheEntryTimerTask] run: KeyStore has been garbage-collected. Removing this ExipreCacheEntryTimerTask.
14:45:49,100 INFO [KeyStore][KeyStore$ExipreCacheEntryTimerTask] run: KeyStore has been garbage-collected. Removing this ExipreCacheEntryTimerTask.
14:45:49,113 INFO [KeyStore][KeyStore$ExipreCacheEntryTimerTask] run: KeyStore has been garbage-collected. Removing this ExipreCacheEntryTimerTask.
14:45:49,124 INFO [KeyStore][KeyStore$ExipreCacheEntryTimerTask] run: KeyStore has been garbage-collected. Removing this ExipreCacheEntryTimerTask.
14:45:49,134 INFO [KeyStore][KeyStore$ExipreCacheEntryTimerTask] run: KeyStore has been garbage-collected. Removing this ExipreCacheEntryTimerTask.
14:45:49,149 INFO [KeyStore][KeyStore$ExipreCacheEntryTimerTask] run: KeyStore has been garbage-collected. Removing this ExipreCacheEntryTimerTask.
14:45:49,172 INFO [KeyStore][KeyStore$ExipreCacheEntryTimerTask] run: KeyStore has been garbage-collected. Removing this ExipreCacheEntryTimerTask.
14:45:49,174 INFO [KeyStore][KeyStore$ExipreCacheEntryTimerTask] run: KeyStore has been garbage-collected. Removing this ExipreCacheEntryTimerTask.
14:45:49,188 INFO [KeyStore][KeyStore$ExipreCacheEntryTimerTask] run: KeyStore has been garbage-collected. Removing this ExipreCacheEntryTimerTask.
14:45:49,232 INFO [KeyStore][KeyStore$ExipreCacheEntryTimerTask] run: KeyStore has been garbage-collected. Removing this ExipreCacheEntryTimerTask.
14:45:49,239 INFO [KeyStore][KeyStore$ExipreCacheEntryTimerTask] run: KeyStore has been garbage-collected. Removing this ExipreCacheEntryTimerTask.
14:45:49,245 INFO [KeyStore][KeyStore$ExipreCacheEntryTimerTask] run: KeyStore has been garbage-collected. Removing this ExipreCacheEntryTimerTask.
14:45:49,254 INFO [KeyStore][KeyStore$ExipreCacheEntryTimerTask] run: KeyStore has been garbage-collected. Removing this ExipreCacheEntryTimerTask.
14:46:02,128 INFO [main][KeyStoreKeyTest] generateAndReadManyKeysIndividually: firstKeyID=1 lastKeyID=5000
14:46:02,547 INFO [main][KeyStoreKeyTest] generateAndReadManyKeysIndividually (5000 keys):
00.generateManyKeysIndividually invocationCount=1
recursionLevel=0 invocationCount=1 accumulatedTime=30358 minTime=30358 maxTime=30358
05.generateOneKey invocationCount=5000
recursionLevel=0 invocationCount=5000 accumulatedTime=30340 minTime=0 maxTime=15
07.readKeyStore invocationCount=1
recursionLevel=0 invocationCount=1 accumulatedTime=15 minTime=15 maxTime=15
10.readManyKeys invocationCount=1
recursionLevel=0 invocationCount=1 accumulatedTime=403 minTime=403 maxTime=403
14:46:02,549 INFO [main][KeyStore] getKeySize: System property 'cumulus4j.KeyStore.keySize' is not set. Using default key size (256 bit).
14:46:02,549 INFO [main][KeyStore] createUser: Created master-key with a size of 256 bits. This key will not be modified for this key-store anymore.
14:46:02,549 INFO [main][KeyStore] getEncryptionAlgorithm: System property 'cumulus4j.KeyStore.encryptionAlgorithm' is set to 'Twofish/CBC/PKCS5Padding'. Using this encryption algorithm.
14:46:02,555 INFO [main][KeyStore] getMACAlgorithm: System property 'cumulus4j.KeyStore.macAlgorithm' is set to 'HMACSHA1'. Using this MAC algorithm.
14:46:02,820 DEBUG [Finalizer][CachedMasterKey] clear: Clearing for userName='marco'.
14:46:02,821 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@39cb7ee5
14:46:02,821 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@39cb7ee5
14:46:02,821 DEBUG [Finalizer][MasterKey] clear: Clearing org.cumulus4j.keystore.MasterKey@5ef80a07
14:46:14,756 INFO [KeyStore][KeyStore$ExipreCacheEntryTimerTask] run: KeyStore has been garbage-collected. Removing this ExipreCacheEntryTimerTask.
14:46:15,319 INFO [KeyStore][KeyStore$ExipreCacheEntryTimerTask] run: KeyStore has been garbage-collected. Removing this ExipreCacheEntryTimerTask.
14:46:15,830 INFO [main][KeyStoreKeyTest] generateAndReadManyKeysBulk (35000 keys):
00.generateManyKeysBulk invocationCount=1
recursionLevel=0 invocationCount=1 accumulatedTime=10288 minTime=10288 maxTime=10288
07.readKeyStore invocationCount=1
recursionLevel=0 invocationCount=1 accumulatedTime=107 minTime=107 maxTime=107
10.readManyKeys invocationCount=1
recursionLevel=0 invocationCount=1 accumulatedTime=2863 minTime=2863 maxTime=2863
Tests run: 6, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 44.158 sec
Running org.cumulus4j.keystore.test.LongPropertyTest
Tests run: 1, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 0.013 sec
Results :
Tests run: 42, Failures: 0, Errors: 0, Skipped: 0
[JENKINS] Recording test results
[INFO]
[INFO] --- maven-bundle-plugin:2.3.4:bundle (default-bundle) @ org.cumulus4j.keystore ---
[INFO]
[INFO] --- maven-source-plugin:2.1.2:jar-no-fork (attach-sources) @ org.cumulus4j.keystore ---
[INFO] org already added, skipping
[INFO] org/cumulus4j already added, skipping
[INFO] org/cumulus4j/keystore already added, skipping
[INFO] org/cumulus4j/keystore/prop already added, skipping
[INFO] LICENCE.txt already added, skipping
[INFO] Building jar: /home/tomcat/.jenkins/workspace/org.cumulus4j/org.cumulus4j/org.cumulus4j.keystore/target/org.cumulus4j.keystore-1.2.1-SNAPSHOT-sources.jar
[INFO] org already added, skipping
[INFO] org/cumulus4j already added, skipping
[INFO] org/cumulus4j/keystore already added, skipping
[INFO] org/cumulus4j/keystore/prop already added, skipping
[INFO] LICENCE.txt already added, skipping
[INFO]
[INFO] --- maven-install-plugin:2.4:install (default-install) @ org.cumulus4j.keystore ---
[INFO] Installing /home/tomcat/.jenkins/workspace/org.cumulus4j/org.cumulus4j/org.cumulus4j.keystore/target/org.cumulus4j.keystore-1.2.1-SNAPSHOT.jar to /home/tomcat/.m2/repository/org/cumulus4j/org.cumulus4j.keystore/1.2.1-SNAPSHOT/org.cumulus4j.keystore-1.2.1-SNAPSHOT.jar
[INFO] Installing /home/tomcat/.jenkins/workspace/org.cumulus4j/org.cumulus4j/org.cumulus4j.keystore/pom.xml to /home/tomcat/.m2/repository/org/cumulus4j/org.cumulus4j.keystore/1.2.1-SNAPSHOT/org.cumulus4j.keystore-1.2.1-SNAPSHOT.pom
[INFO] Installing /home/tomcat/.jenkins/workspace/org.cumulus4j/org.cumulus4j/org.cumulus4j.keystore/target/org.cumulus4j.keystore-1.2.1-SNAPSHOT-sources.jar to /home/tomcat/.m2/repository/org/cumulus4j/org.cumulus4j.keystore/1.2.1-SNAPSHOT/org.cumulus4j.keystore-1.2.1-SNAPSHOT-sources.jar
[INFO]
[INFO] --- maven-bundle-plugin:2.3.4:install (default-install) @ org.cumulus4j.keystore ---
[WARNING] Ignoring project type bundle - supportedProjectTypes = []
Console Output
Help us localize this page