ArecaVSS - The Volume Shadow Copy plugin for Areca-Backup

Home

Download ArecaVSS

Get a license for ArecaVSS (free or full)

Frequently Asked Questions (FAQ)

Tickets :

Item #44 - ERROR - Error caught while reading VSS index properties for entry [Closed - Unresolved]

Getting a VSS error when trying to run a backup on new windows 2012 vm.



15-07-06 10:28 - INFO - Merge in progress ...
15-07-06 10:28 - INFO - Post-merge archive verification is enabled.
15-07-06 10:28 - INFO - Starting merge from Jun 11, 2015 3:10 AM to Jun 17, 2015 3:09 AM.
15-07-06 10:28 - INFO - Recovering from Jun 11, 2015 3:10 AM to Jun 17, 2015 3:09 AM.
15-07-06 10:28 - INFO - Adding R:/backup/UsersBackup/113432543/150617 (Incremental backup) to recovery list.
15-07-06 10:28 - INFO - Adding R:/backup/UsersBackup/113432543/150616 (Incremental backup) to recovery list.
15-07-06 10:28 - INFO - Adding R:/backup/UsersBackup/113432543/150615 (Incremental backup) to recovery list.
15-07-06 10:28 - INFO - Adding R:/backup/UsersBackup/113432543/150614 (Incremental backup) to recovery list.
15-07-06 10:28 - INFO - Adding R:/backup/UsersBackup/113432543/150613 (Incremental backup) to recovery list.
15-07-06 10:28 - INFO - Adding R:/backup/UsersBackup/113432543/150612 (Incremental backup) to recovery list.
15-07-06 10:28 - INFO - Adding R:/backup/UsersBackup/113432543/150611 (Incremental backup) to recovery list.
15-07-06 10:28 - INFO - Deleted entries won't be recovered.
15-07-06 10:28 - INFO - Recovery filter : /
15-07-06 10:28 - INFO - 7 archives will be processed.
15-07-06 10:28 - INFO - Files will be recovered in R:/backup/UsersBackup/113432543/150617_1
15-07-06 10:28 - DETAIL - Building entries map for 7 archives.
15-07-06 10:28 - INFO - 587 files will be recovered.
15-07-06 10:28 - INFO - Data recovery ...
15-07-06 10:28 - INFO - Recovering R:/backup/UsersBackup/113432543/150611 (19 files) ...
15-07-06 10:28 - INFO - Physical View - Looking for archives in R:/backup/ProgramData/624939994
15-07-06 10:28 - INFO - Physical View - Looking for archives in R:/backup/330407229
15-07-06 10:28 - INFO - Physical View - Looking for archives in R:/backup/ATV/54368010
15-07-06 10:28 - INFO - Physical View - Looking for archives in R:/backup/330407229
15-07-06 10:28 - DETAIL - Configuration for target 330407229 (CloudBackup) :

<target uid="330407229" follow_symlinks="true" register_empty_directories="true" follow_subdirs="true" xml_security_copy="true" name="CloudBackup" forward_preproc_errors="true" description="">
<source path="C:/filestorage"/>
<medium type="directory" file_compression="true" policy="hd" path="R:/backup/330407229" archive_name="%YY%%MM%%DD%" encrypted="true" encryption_algo="AES_HASH" encrypt_names="false" encrypted_names_policy="default" overwrite="false" inspect_file_content="false" volume_size="2048" volume_digits="4" zip_level="6" zip_ext="true" zip_charset="UTF-8" zip64="true">
<handler type="standard"/>
<transaction_configuration use_transactions="true" transaction_size="51200"/>
</medium>
<addons>
<addon id="VSS"/>
</addons>
<filter_group logical_not="false" operator="and" >
<extension_filter logical_not="true">
<ext>.tmp</ext>
<ext>.temp</ext>
</extension_filter>
</filter_group>
</target>
15-07-06 10:28 - INFO - Looking for pending transactions ...
15-07-06 10:28 - INFO - No transaction point found.
15-07-06 10:28 - INFO - Starting backup on CloudBackup (330407229). Backup scheme = Incremental backup
15-07-06 10:28 - INFO - Backup in progress ...
15-07-06 10:28 - INFO - Initializing backup context ...
15-07-06 10:28 - INFO - Global source root : C:/filestorage
15-07-06 10:28 - INFO - Checking Areca's VSS index
15-07-06 10:28 - ERROR - Error caught while reading VSS index properties for entry : C:\Users\jharrell\AppData\Local\Temp\tmp-jharrell\arecavss-mnt\330407229\_index\EC46B184-5471-4CF9-822F-68487846CD9B - java.lang.NullPointerException
at com.arecavss.plugin.VSSIndexHelper.cleanIndex(VSSIndexHelper.java:90)
at com.arecavss.plugin.ArecaVSSConfigurationAddon.ensureVSSSnapshots(ArecaVSSConfigurationAddon.java:132)
at com.arecavss.plugin.ArecaVSSConfigurationAddon.open(ArecaVSSConfigurationAddon.java:70)
at com.application.areca.AbstractTarget.open(AbstractTarget.java:323)
at com.application.areca.impl.FileSystemTarget.open(FileSystemTarget.java:223)
at com.application.areca.AbstractTarget.processBackup(AbstractTarget.java:376)
at com.application.areca.ActionProxy.processBackupOnTarget(ActionProxy.java:98)
at com.application.areca.launcher.gui.Application$9.runCommand(Application.java:1329)
at com.application.areca.launcher.gui.Application$ProcessRunner.run(Application.java:1857)
at java.lang.Thread.run(Unknown Source)

15-07-06 10:28 - INFO - Creating shadow copies for target #330407229 (CloudBackup)
15-07-06 10:28 - INFO - Existing shadow copies :
15-07-06 10:28 - INFO - Retrieving shadow copies ...
15-07-06 10:28 - INFO - Volume shadow copy #0, ID={B18C3BAF-CCC2-481F-9E0E-CEB4A18639A5}, DeviceObject=\\?\GLOBALROOT\Device\HarddiskVolumeShadowCopy3, Provider={B5946137-7B9F-4925-AF80-51ABD60B20D5}
15-07-06 10:28 - INFO - Volume shadow copy #1, ID={6CA2952F-0BED-465F-BEBE-4378BCF1817E}, DeviceObject=\\?\GLOBALROOT\Device\HarddiskVolumeShadowCopy4311, Provider={B5946137-7B9F-4925-AF80-51ABD60B20D5}
15-07-06 10:28 - ERROR - com.application.areca.ApplicationException: Volume shadow copy error for drive c:\ null
at com.arecavss.plugin.ArecaVSSConfigurationAddon.ensureVSSSnapshot(ArecaVSSConfigurationAddon.java:203)
at com.arecavss.plugin.ArecaVSSConfigurationAddon.ensureVSSSnapshots(ArecaVSSConfigurationAddon.java:154)
at com.arecavss.plugin.ArecaVSSConfigurationAddon.open(ArecaVSSConfigurationAddon.java:70)
at com.application.areca.AbstractTarget.open(AbstractTarget.java:323)
at com.application.areca.impl.FileSystemTarget.open(FileSystemTarget.java:223)
at com.application.areca.AbstractTarget.processBackup(AbstractTarget.java:376)
at com.application.areca.ActionProxy.processBackupOnTarget(ActionProxy.java:98)
at com.application.areca.launcher.gui.Application$9.runCommand(Application.java:1329)
at com.application.areca.launcher.gui.Application$ProcessRunner.run(Application.java:1857)
at java.lang.Thread.run(Unknown Source)
Caused by: java.lang.NullPointerException
at com.arecavss.plugin.VSSIndexHelper.cleanShadowCopies(VSSIndexHelper.java:114)
at com.arecavss.plugin.ArecaVSSConfigurationAddon.ensureVSSSnapshot(ArecaVSSConfigurationAddon.java:171)
... 9 more

15-07-06 10:28 - INFO - Aborting backup ...
15-07-06 10:28 - INFO - Abort completed.
15-07-06 10:28 - INFO - Backup completed.
15-07-06 10:28 - INFO - Backup completed on CloudBackup (330407229)
15-07-06 10:28 - INFO - Recovering R:/backup/UsersBackup/113432543/150612 (24 files) ...
15-07-06 10:28 - INFO - Recovering R:/backup/UsersBackup/113432543/150613 (421 files) ...
15-07-06 10:34 - INFO - Recovering R:/backup/UsersBackup/113432543/150614 (7 files) ...
15-07-06 10:34 - INFO - Recovering R:/backup/UsersBackup/113432543/150615 (24 files) ...
15-07-06 10:51 - INFO - Recovering R:/backup/UsersBackup/113432543/150616 (11 files) ...
15-07-06 10:51 - INFO - Recovering R:/backup/UsersBackup/113432543/150617 (81 files) ...
15-07-06 10:51 - INFO - Recovery completed - Merged archive creation ...
15-07-06 10:51 - INFO - Committing merge ...
15-07-06 10:51 - INFO - Merge completed
15-07-06 10:51 - INFO - Checking archive (working directory : R:/backup/UsersBackup/113432543/chk0) ...
15-07-06 10:51 - INFO - Recovering R:/backup/UsersBackup/113432543/150617_1.
15-07-06 10:51 - INFO - Adding R:/backup/UsersBackup/113432543/150617_1 (Incremental backup) to recovery list.
15-07-06 10:51 - INFO - Deleted entries won't be recovered.
15-07-06 10:51 - INFO - Recovery filter : /
15-07-06 10:51 - INFO - 1 archives will be processed.
15-07-06 10:51 - INFO - Files will be recovered in R:/backup/UsersBackup/113432543/chk0
15-07-06 10:51 - DETAIL - Building entries map for 1 archives.
15-07-06 10:51 - INFO - 587 files will be recovered.
15-07-06 10:51 - INFO - Registring a new file system driver : Mount Point = R:\backup\UsersBackup\113432543\chk0, Driver = [ContentHashFileSystemDriver - Predecessor=[EventFileSystemDriver - Identifier="Areca repository access" - Predecessor=[CompressedFileSystemDriver - Predecessor=[EncryptedFileSystemDriver - Root=R:\backup\UsersBackup\113432543 - Predecessor=[DefaultFileSystemDriver]]]]]
15-07-06 10:51 - INFO - Data recovery ...
15-07-06 10:51 - INFO - Recovering R:/backup/UsersBackup/113432543/150617_1 (587 files) ...
15-07-06 10:58 - INFO - Checking recovered files ...
15-07-06 10:58 - INFO - Using content of archive R:\backup\UsersBackup\113432543\150617_1 as reference.
15-07-06 10:58 - INFO - Recovery completed - Checking recovered files (this may take some time) ...
15-07-06 10:58 - INFO - Check completed - 587 files checked.
15-07-06 10:58 - INFO - Unregistring file system driver : Mount Point = R:\backup\UsersBackup\113432543\chk0, Driver = [ContentHashFileSystemDriver - Predecessor=[EventFileSystemDriver - Identifier="Areca repository access" - Predecessor=[CompressedFileSystemDriver - Predecessor=[EncryptedFileSystemDriver - Root=R:\backup\UsersBackup\113432543 - Predecessor=[DefaultFileSystemDriver]]]]]
15-07-06 10:58 - INFO - Cleaning recovered files (R:/backup/UsersBackup/113432543/chk0) ...
15-07-06 10:58 - INFO - Recovered files cleaned.
15-07-06 10:58 - INFO - Cleaning old archives ...
15-07-06 10:58 - INFO - Cleaning old archives ...
15-07-06 10:58 - INFO - Deleting unnecessary archives : 0 archives.
15-07-06 10:58 - INFO - Cleaning recovered archives : 7 archives.
15-07-06 10:58 - INFO - Deleting R:/backup/UsersBackup/113432543/150611 ...
15-07-06 10:58 - INFO - Deleting R:/backup/UsersBackup/113432543/150612 ...
15-07-06 10:58 - INFO - Deleting R:/backup/UsersBackup/113432543/150613 ...
15-07-06 10:58 - INFO - Deleting R:/backup/UsersBackup/113432543/150614 ...
15-07-06 10:58 - INFO - Deleting R:/backup/UsersBackup/113432543/150615 ...
15-07-06 10:58 - INFO - Deleting R:/backup/UsersBackup/113432543/150616 ...
15-07-06 10:58 - INFO - Deleting R:/backup/UsersBackup/113432543/150617 ...
15-07-06 10:58 - INFO - 7 archives merged.
15-07-06 10:58 - INFO - Merge completed.
15-07-06 10:58 - INFO - Physical View - Looking for archives in R:/backup/330407229
15-07-06 11:28 - INFO - Physical View - Looking for archives in R:/backup/UsersBackup/113432543
15-07-06 11:28 - INFO - Physical View - Looking for archives in R:/backup/ProgramData/624939994
15-07-06 11:28 - INFO - Physical View - Looking for archives in R:/backup/330407229
15-07-06 11:28 - INFO - Physical View - Looking for archives in R:/backup/ATV/54368010
15-07-06 11:28 - INFO - Closing Areca's main window ...
15-07-06 11:28 - INFO - Closing Areca (force=false)
15-07-06 11:28 - INFO - Closing Areca (force=false)
15-07-06 11:28 - INFO - Deleting 27 temporary files ...
15-07-06 11:28 - INFO - Temporary files deleted.
15-07-06 11:28 - DETAIL - Ran linkd on \\?\GLOBALROOT\Device\HarddiskVolumeShadowCopy4311
15-07-06 11:28 - INFO - Deleting shadow copy {6CA2952F-0BED-465F-BEBE-4378BCF1817E}
15-07-06 11:28 - INFO - Shadow copy {6CA2952F-0BED-465F-BEBE-4378BCF1817E} successfully deleted.
15-07-06 11:28 - INFO - Loading configured file metadata accessor : [com.myJava.file.metadata.windows.WindowsMetaDataAccessor] ...
15-07-06 11:28 - DETAIL - Configured metadata accessor description :
15-07-06 11:28 - DETAIL - Default metadata accessor for Windows. It only handles the "read-only" file attribute.
15-07-06 11:28 - INFO - Testing configured file metadata accessor ...
15-07-06 11:28 - INFO - [com.myJava.file.metadata.windows.WindowsMetaDataAccessor] validated.
15-07-06 11:28 - INFO - ACL support : no
15-07-06 11:28 - INFO - Extended attributes support : no
15-07-06 11:28 - INFO - System informations :
15-07-06 11:28 - INFO - ----------------------------------------
15-07-06 11:28 - INFO - Version : 7.4.9
15-07-06 11:28 - INFO - Build ID : 7856197430637268730
15-07-06 11:28 - INFO - Available Memory : 455 MB
15-07-06 11:28 - INFO - OS Name : Windows Server 2012 R2 - 6.3
15-07-06 11:28 - INFO - Java Virtual Machine : Java(TM) SE Runtime Environment - 1.8.0_45-b15 - Oracle Corporation
15-07-06 11:28 - INFO - File encoding : windows-1252
15-07-06 11:28 - INFO - Language : en
15-07-06 11:28 - INFO - Framework properties : {filetool.delay=200, ftp.debug=false, repository.access.ftp.cache=true, memory.safety.margin=0.3, gzip.enabled=true, sftp.preferred.auth.override=, threadlocal.log.level=2, encryption.keygen.iterations=96731, filetool.buffer.size=200000, zip.crc.enable=true, fs.max.filepath.check.force=-1, delta.debug=false, fs.max.filepath=256, zip.mv.digits=2, fs.use.buffer=true, memory.base.kb=20480, cache.preload=false, fs.max.cached.mountpoints=2000, repository.check.consistency=true, ftp.max.proxies=4, delta.quickhash.modulus=68228191, encryption.keygen.algorithm=PBKDF2WithHmacSHA1, posix.def.metadata.accessor.command=ls, memory.by.entry.kb=2, repository.access.hd.cache.depth=2, ftp.use.cache=true, ftp.noop.delay=30000, file.hash.algorithm=SHA, zip.buffer.size=2048, hash.cache.size=200, log.default.history=10, ftp.cache.size=100, os.browsers=firefox, opera, konqueror, epiphany, mozilla, netscape, file.streams.debug=true, sftp.timeout=5000, delta.quickhash.multiplier=98813, repository.access.hd.cache=false, threadlocal.log.max.messages=200, viewer.handler.impl=com.myJava.system.viewer.DesktopViewerHandler, fs.tmp.directory=, log.level=5, delta.hashmap.size=10007, smtp.debug=false, hash.use.cache=true, encryption.keygen.salt.encoding=UTF-8, posix.def.metadata.accessor.args=-ald1, encryption.keygen.salt=ù%${{²]}}[|`è$£^¤*!§:/..;;,,_?"\°à@@%µ, fs.cache.debug=false, backup.debug=false, repository.access.ftp.cache.depth=2, filesystem.accessor.impl=com.myJava.file.metadata.windows.WindowsMetaDataAccessor, sse.protocols=SSL, TLS, TLS-P, TLS-C, repository.access.debug=false, fs.buffer.size=10240}
15-07-06 11:28 - INFO - Available translations : br, cn, cs, da, de, en, es, fr, hu, it, ja, nl, pt, ru, sv, tw
15-07-06 11:28 - INFO - File metadata accessor : com.myJava.file.metadata.windows.WindowsMetaDataAccessor
15-07-06 11:28 - INFO - ----------------------------------------
15-07-06 11:28 - INFO - User preferences :
15-07-06 11:28 - INFO - ----------------------------------------
15-07-06 11:28 - INFO - [mainframe.x] = [153]
15-07-06 11:28 - INFO - [check.specific.location.113432543] = [C:\Users\jharrell\AppData\Local\Temp\3\]
15-07-06 11:28 - INFO - [ws.history.0] = [C:/Users/jharrell/.areca/workspace]
15-07-06 11:28 - INFO - [merge.use.specific.location.624939994] = [false]
15-07-06 11:28 - INFO - [check.specific.location.330407229] = [C:\Users\jharrell\AppData\Local\Temp\36\]
15-07-06 11:28 - INFO - [lastworkspace] = [C:/Users/jharrell/.areca/workspace]
15-07-06 11:28 - INFO - [check.force.default.location.624939994] = [false]
15-07-06 11:28 - INFO - [target.lasttargetdir] = [R:\backup\ATV]
15-07-06 11:28 - INFO - [merge.use.specific.location.113432543] = [false]
15-07-06 11:28 - INFO - [check.force.default.location.113432543] = [false]
15-07-06 11:28 - INFO - [merge.use.specific.location.330407229] = [false]
15-07-06 11:28 - INFO - [check.force.default.location.330407229] = [false]
15-07-06 11:28 - INFO - [merge.specific.location.330407229] = [C:\Users\jharrell\AppData\Local\Temp\12\jharrell]
15-07-06 11:28 - INFO - [launch.count] = [1179]
15-07-06 11:28 - INFO - [mainframe.width] = [1121]
15-07-06 11:28 - INFO - [check.specific.location.54368010] = [C:\Users\jharrell\AppData\Local\Temp\2\jharrell]
15-07-06 11:28 - INFO - [show.transaction.ziparchive.incompatibility.warning] = [true]
15-07-06 11:28 - INFO - [mainframe.leftsplitpos] = [70]
15-07-06 11:28 - INFO - [check.new.versions] = [false]
15-07-06 11:28 - INFO - [mainframe.mainsplitpos] = [21]
15-07-06 11:28 - INFO - [merge.specific.location.624939994] = [C:\Users\jharrell\AppData\Local\Temp\2\jharrell]
15-07-06 11:28 - INFO - [dnt.msg.day] = [5613]
15-07-06 11:28 - INFO - [merge.specific.location.113432543] = [C:\Users\jharrell\AppData\Local\Temp\3\]
15-07-06 11:28 - INFO - [mainframe.height] = [726]
15-07-06 11:28 - INFO - [check.force.default.location.54368010] = [false]
15-07-06 11:28 - INFO - [mainframe.maximized] = [false]
15-07-06 11:28 - INFO - [check.specific.location.624939994] = [C:\Users\jharrell\AppData\Local\Temp\3\jharrell]
15-07-06 11:28 - INFO - [mainframe.y] = [103]
15-07-06 11:28 - INFO - ----------------------------------------
15-07-06 11:28 - INFO - Reading content of C:/Users/jharrell/.areca/workspace
15-07-06 11:28 - INFO - Reading target configuration file : C:/Users/jharrell/.areca/workspace/113432543.bcfg
15-07-06 11:28 - INFO - Looking for plugins in directory : C:/Program Files (x86)/Areca/plugins
15-07-06 11:28 - INFO - Attempting to load plugin directory : C:/Program Files (x86)/Areca/plugins/arecavss
15-07-06 11:28 - INFO - Reading plugin configuration file : C:/Program Files (x86)/Areca/plugins/arecavss/arecavss.properties
15-07-06 11:28 - INFO - Loading jar file : C:/Program Files (x86)/Areca/plugins/arecavss/arecavss.jar
15-07-06 11:28 - INFO - Loading jar file : C:/Program Files (x86)/Areca/plugins/arecavss/jacob.jar
15-07-06 11:28 - INFO - Loading jar file : C:/Program Files (x86)/Areca/plugins/arecavss/bcmail-jdk14-147.jar
15-07-06 11:28 - INFO - Loading jar file : C:/Program Files (x86)/Areca/plugins/arecavss/bcpg-jdk14-147.jar
15-07-06 11:28 - INFO - Loading jar file : C:/Program Files (x86)/Areca/plugins/arecavss/bcpkix-jdk14-147.jar
15-07-06 11:28 - INFO - Loading jar file : C:/Program Files (x86)/Areca/plugins/arecavss/bcprov-ext-jdk14-147.jar
15-07-06 11:28 - INFO - Loading jar file : C:/Program Files (x86)/Areca/plugins/arecavss/bcprov-jdk14-147.jar
15-07-06 11:28 - INFO - Loading jar file : C:/Program Files (x86)/Areca/plugins/arecavss/jna-platform-4.0.0.jar
15-07-06 11:28 - INFO - Loading jar file : C:/Program Files (x86)/Areca/plugins/arecavss/jna-4.0.0.jar
15-07-06 11:28 - INFO - Loading jar file : C:/Program Files (x86)/Areca/plugins/arecavss/
15-07-06 11:28 - INFO - Instanciating class : com.arecavss.plugin.ArecaVSSPlugin
15-07-06 11:28 - INFO - Plugin successfully registered : [ArecaVSSPlugin - Name="VSS" - Id="VSS" - Version=[VersionData - Version="2.3" - Date="2013-11-11" - URL=<null> - Description="Minor error messages improvements." - Additional Notes=<null> - Implementation Notes=<null>]]
15-07-06 11:28 - INFO - Plugin directory successfully loaded.
15-07-06 11:28 - INFO - Plugin successfully registered : [DefaultStoragePlugin - Name="Local Hard Drive" - Id="hd" - Version=[VersionData - Version="7.4.9" - Date="2014-11-26" - URL=<null> - Description="Fixed compression issue that could occur with filenames containing line breaks." - Additional Notes=<null> - Implementation Notes=<null>]]
15-07-06 11:28 - INFO - Plugin successfully registered : [FTPStoragePlugin - Name="FTP server" - Id="ftp" - Version=[VersionData - Version="7.4.9" - Date="2014-11-26" - URL=<null> - Description="Fixed compression issue that could occur with filenames containing line breaks." - Additional Notes=<null> - Implementation Notes=<null>]]
15-07-06 11:28 - INFO - Plugin successfully registered : [SFTPStoragePlugin - Name="SFTP server" - Id="sftp" - Version=[VersionData - Version="7.4.9" - Date="2014-11-26" - URL=<null> - Description="Fixed compression issue that could occur with filenames containing line breaks." - Additional Notes=<null> - Implementation Notes=<null>]]
15-07-06 11:28 - INFO - Installing medium : [IncrementalDirectoryMedium - FileSystemPolicy=[DefaultFileSystemPolicy - Path="R:/backup/UsersBackup/113432543" - Name="%YY%%MM%%DD%"] - EncryptionPolicy=[EncryptionPolicy - IsEncrypted=true - Algorithm="AES_HASH" - Encrypt names=false - Wrap="default"] - CompressionArguments=[CompressionArguments - IsCompressed=true - Zip64=true - Add extension=false - Charset="UTF-8" - Comment=<null> - VolumeSize=-1 - NbDigits=0 - Level=4] - Image=false - MaxThroughput=-1.000 - Transaction Size=51200]
15-07-06 11:28 - WARNING - AES256_HASH (AES 256 - Passphrase) encryption configuration is not supported by your system (Illegal key size or default parameters). It will be removed from the available encryption configurations.
15-07-06 11:28 - WARNING - AES256_RAW (AES 256 - Raw key) encryption configuration is not supported by your system (Illegal key size or default parameters). It will be removed from the available encryption configurations.
15-07-06 11:28 - WARNING - AES256_HASH_CBC (AES 256 - Passphrase - CBC) encryption configuration is not supported by your system (Illegal key size). It will be removed from the available encryption configurations.
15-07-06 11:28 - WARNING - AES256_RAW_CBC (AES 256 - Raw key - CBC) encryption configuration is not supported by your system (Illegal key size). It will be removed from the available encryption configurations.
15-07-06 11:28 - INFO - Registring a new file system driver : Mount Point = R:\backup\UsersBackup, Driver = [EventFileSystemDriver - Identifier="Areca repository access" - Predecessor=[DefaultFileSystemDriver]]
15-07-06 11:28 - INFO - Registring a new file system driver : Mount Point = R:\backup\UsersBackup\113432543, Driver = [EventFileSystemDriver - Identifier="Areca repository access" - Predecessor=[CompressedFileSystemDriver - Predecessor=[EncryptedFileSystemDriver - Root=R:\backup\UsersBackup\113432543 - Predecessor=[DefaultFileSystemDriver]]]]
15-07-06 11:28 - WARNING - The filtered directory does not exist. (C:/Users/All Users/DriveClient)
15-07-06 11:28 - INFO - Reading target configuration file : C:/Users/jharrell/.areca/workspace/330407229.bcfg
15-07-06 11:28 - INFO - Installing medium : [IncrementalDirectoryMedium - FileSystemPolicy=[DefaultFileSystemPolicy - Path="R:/backup/330407229" - Name="%YY%%MM%%DD%"] - EncryptionPolicy=[EncryptionPolicy - IsEncrypted=true - Algorithm="AES_HASH" - Encrypt names=false - Wrap="default"] - CompressionArguments=[CompressionArguments - IsCompressed=true - Zip64=true - Add extension=true - Charset="UTF-8" - Comment=<null> - VolumeSize=2048 - NbDigits=4 - Level=6] - Image=false - MaxThroughput=-1.000 - Transaction Size=51200]
15-07-06 11:28 - INFO - Registring a new file system driver : Mount Point = R:\backup, Driver = [EventFileSystemDriver - Identifier="Areca repository access" - Predecessor=[DefaultFileSystemDriver]]
15-07-06 11:28 - INFO - Registring a new file system driver : Mount Point = R:\backup\330407229, Driver = [EventFileSystemDriver - Identifier="Areca repository access" - Predecessor=[CompressedFileSystemDriver - Predecessor=[EncryptedFileSystemDriver - Root=R:\backup\330407229 - Predecessor=[DefaultFileSystemDriver]]]]
15-07-06 11:28 - INFO - Reading target configuration file : C:/Users/jharrell/.areca/workspace/54368010.bcfg
15-07-06 11:28 - INFO - Installing medium : [IncrementalDirectoryMedium - FileSystemPolicy=[DefaultFileSystemPolicy - Path="R:/backup/ATV/54368010" - Name="%YY%%MM%%DD%"] - EncryptionPolicy=[EncryptionPolicy - IsEncrypted=false] - CompressionArguments=[CompressionArguments - IsCompressed=true - Zip64=true - Add extension=true - Charset="UTF-8" - Comment=<null> - VolumeSize=-1 - NbDigits=0 - Level=9] - Image=false - MaxThroughput=-1.000 - Transaction Size=51200]
15-07-06 11:28 - INFO - Registring a new file system driver : Mount Point = R:\backup\ATV, Driver = [EventFileSystemDriver - Identifier="Areca repository access" - Predecessor=[DefaultFileSystemDriver]]
15-07-06 11:28 - INFO - Registring a new file system driver : Mount Point = R:\backup\ATV\54368010, Driver = [EventFileSystemDriver - Identifier="Areca repository access" - Predecessor=[CompressedFileSystemDriver - Predecessor=[DefaultFileSystemDriver]]]
15-07-06 11:28 - INFO - Reading target configuration file : C:/Users/jharrell/.areca/workspace/624939994.bcfg
15-07-06 11:28 - INFO - Installing medium : [IncrementalDirectoryMedium - FileSystemPolicy=[DefaultFileSystemPolicy - Path="R:/backup/ProgramData/624939994" - Name="%YY%%MM%%DD%"] - EncryptionPolicy=[EncryptionPolicy - IsEncrypted=true - Algorithm="AES_HASH" - Encrypt names=false - Wrap="default"] - CompressionArguments=[CompressionArguments - IsCompressed=true - Zip64=true - Add extension=false - Charset="UTF-8" - Comment=<null> - VolumeSize=-1 - NbDigits=0 - Level=9] - Image=false - MaxThroughput=-1.000 - Transaction Size=51200]
15-07-06 11:28 - INFO - Registring a new file system driver : Mount Point = R:\backup\ProgramData, Driver = [EventFileSystemDriver - Identifier="Areca repository access" - Predecessor=[DefaultFileSystemDriver]]
15-07-06 11:28 - INFO - Registring a new file system driver : Mount Point = R:\backup\ProgramData\624939994, Driver = [EventFileSystemDriver - Identifier="Areca repository access" - Predecessor=[CompressedFileSystemDriver - Predecessor=[EncryptedFileSystemDriver - Root=R:\backup\ProgramData\624939994 - Predecessor=[DefaultFileSystemDriver]]]]
15-07-06 11:28 - INFO - Path : [C:\Users\jharrell\.areca\workspace] - 4 items loaded.
15-07-06 11:28 - INFO - Physical View - Looking for archives in R:/backup/330407229
15-07-06 11:28 - INFO - Tried to load zip library (Native Library C:\Program Files\Java\jre1.8.0_45\bin\zip.dll already loaded in another classloader)
15-07-06 11:28 - INFO - Using com.myJava.system.viewer.DesktopViewerHandler as viewer handler.
15-07-06 11:28 - INFO - Looking for license file in plugin directory : C:\Program Files (x86)\Areca\plugins\arecavss
15-07-06 11:28 - DETAIL - Trying arecavss.license ...
15-07-06 11:28 - INFO - ArecaVSS License found (C:\Program Files (x86)\Areca\plugins\arecavss\arecavss.license) : [License - uid="1719931613.532756141" - type=2 - email="jon@creativetechshop.com" - name="Creative Tech Shop (license for 12 computers)" - expiry=<null>]
15-07-06 11:29 - INFO - Installing medium : [IncrementalDirectoryMedium - FileSystemPolicy=[DefaultFileSystemPolicy - Path="R:/backup/330407229" - Name="%YY%%MM%%DD%"] - EncryptionPolicy=[EncryptionPolicy - IsEncrypted=true - Algorithm="AES_HASH" - Encrypt names=false - Wrap="default"] - CompressionArguments=[CompressionArguments - IsCompressed=true - Zip64=true - Add extension=true - Charset="UTF-8" - Comment=<null> - VolumeSize=2048 - NbDigits=4 - Level=6] - Image=false - MaxThroughput=-1.000 - Transaction Size=51200]
15-07-06 11:29 - INFO - Registring a new file system driver : Mount Point = R:\backup, Driver = [EventFileSystemDriver - Identifier="Areca repository access" - Predecessor=[DefaultFileSystemDriver]]
15-07-06 11:29 - INFO - Registring a new file system driver : Mount Point = R:\backup\330407229, Driver = [EventFileSystemDriver - Identifier="Areca repository access" - Predecessor=[CompressedFileSystemDriver - Predecessor=[EncryptedFileSystemDriver - Root=R:\backup\330407229 - Predecessor=[DefaultFileSystemDriver]]]]
15-07-06 11:29 - INFO - Physical View - Looking for archives in R:/backup/330407229
15-07-06 11:29 - DETAIL - Configuration for target 330407229 (CloudBackup) :

<target uid="330407229" follow_symlinks="true" register_empty_directories="true" follow_subdirs="true" xml_security_copy="true" name="CloudBackup" forward_preproc_errors="true" description="">
<source path="F:/"/>
<medium type="directory" file_compression="true" policy="hd" path="R:/backup/330407229" archive_name="%YY%%MM%%DD%" encrypted="true" encryption_algo="AES_HASH" encrypt_names="false" encrypted_names_policy="default" overwrite="false" inspect_file_content="false" volume_size="2048" volume_digits="4" zip_level="6" zip_ext="true" zip_charset="UTF-8" zip64="true">
<handler type="standard"/>
<transaction_configuration use_transactions="true" transaction_size="51200"/>
</medium>
<addons>
<addon id="VSS"/>
</addons>
<filter_group logical_not="false" operator="and" >
<extension_filter logical_not="true">
<ext>.tmp</ext>
<ext>.temp</ext>
</extension_filter>
</filter_group>
</target>
15-07-06 11:29 - INFO - Looking for pending transactions ...
15-07-06 11:29 - INFO - No transaction point found.
15-07-06 11:29 - INFO - Starting backup on CloudBackup (330407229). Backup scheme = Incremental backup
15-07-06 11:29 - INFO - Backup in progress ...
15-07-06 11:29 - INFO - Initializing backup context ...
15-07-06 11:29 - INFO - Global source root : F:/
15-07-06 11:29 - INFO - Checking Areca's VSS index
15-07-06 11:29 - ERROR - Error caught while reading VSS index properties for entry : C:\Users\jharrell\AppData\Local\Temp\tmp-jharrell\arecavss-mnt\330407229\_index\EC46B184-5471-4CF9-822F-68487846CD9B - java.lang.NullPointerException
at com.arecavss.plugin.VSSIndexHelper.cleanIndex(VSSIndexHelper.java:90)
at com.arecavss.plugin.ArecaVSSConfigurationAddon.ensureVSSSnapshots(ArecaVSSConfigurationAddon.java:132)
at com.arecavss.plugin.ArecaVSSConfigurationAddon.open(ArecaVSSConfigurationAddon.java:70)
at com.application.areca.AbstractTarget.open(AbstractTarget.java:323)
at com.application.areca.impl.FileSystemTarget.open(FileSystemTarget.java:223)
at com.application.areca.AbstractTarget.processBackup(AbstractTarget.java:376)
at com.application.areca.ActionProxy.processBackupOnTarget(ActionProxy.java:98)
at com.application.areca.launcher.gui.Application$9.runCommand(Application.java:1329)
at com.application.areca.launcher.gui.Application$ProcessRunner.run(Application.java:1857)
at java.lang.Thread.run(Unknown Source)

15-07-06 11:29 - INFO - Creating shadow copies for target #330407229 (CloudBackup)
15-07-06 11:29 - INFO - Existing shadow copies :
15-07-06 11:29 - DETAIL - Plugin environment validated (OS, administrator rights and JRE architecture)
15-07-06 11:29 - INFO - Retrieving shadow copies ...
15-07-06 11:29 - INFO - Volume shadow copy #0, ID={B18C3BAF-CCC2-481F-9E0E-CEB4A18639A5}, DeviceObject=\\?\GLOBALROOT\Device\HarddiskVolumeShadowCopy3, Provider={B5946137-7B9F-4925-AF80-51ABD60B20D5}
15-07-06 11:29 - ERROR - com.application.areca.ApplicationException: Volume shadow copy error for drive f:\ null
at com.arecavss.plugin.ArecaVSSConfigurationAddon.ensureVSSSnapshot(ArecaVSSConfigurationAddon.java:203)
at com.arecavss.plugin.ArecaVSSConfigurationAddon.ensureVSSSnapshots(ArecaVSSConfigurationAddon.java:154)
at com.arecavss.plugin.ArecaVSSConfigurationAddon.open(ArecaVSSConfigurationAddon.java:70)
at com.application.areca.AbstractTarget.open(AbstractTarget.java:323)
at com.application.areca.impl.FileSystemTarget.open(FileSystemTarget.java:223)
at com.application.areca.AbstractTarget.processBackup(AbstractTarget.java:376)
at com.application.areca.ActionProxy.processBackupOnTarget(ActionProxy.java:98)
at com.application.areca.launcher.gui.Application$9.runCommand(Application.java:1329)
at com.application.areca.launcher.gui.Application$ProcessRunner.run(Application.java:1857)
at java.lang.Thread.run(Unknown Source)
Caused by: java.lang.NullPointerException
at com.arecavss.plugin.VSSIndexHelper.cleanShadowCopies(VSSIndexHelper.java:114)
at com.arecavss.plugin.ArecaVSSConfigurationAddon.ensureVSSSnapshot(ArecaVSSConfigurationAddon.java:171)
... 9 more

15-07-06 11:29 - INFO - Loading history ...
15-07-06 11:29 - INFO - History loaded.
15-07-06 11:29 - INFO - Aborting backup ...
15-07-06 11:29 - INFO - Abort completed.
15-07-06 11:29 - INFO - Backup completed.
15-07-06 11:29 - INFO - Backup completed on CloudBackup (330407229)
User #976 - 2015-07-06 18:35

Comments :
Any ideas yet? Still cant get a local backup to finish correctly.
User #976 - 2015-07-21 06:58
I still get this error:

16-01-21 10:19 - INFO - Reading backup context ...
16-01-21 10:19 - INFO - Checking Areca's VSS index
16-01-21 10:19 - ERROR - Error caught while reading VSS index properties for entry : C:\Users\jharrell\AppData\Local\Temp\tmp-jharrell\arecavss-mnt\330407229\_index\EC46B184-5471-4CF9-822F-68487846CD9B - java.lang.NullPointerException
at com.arecavss.plugin.VSSIndexHelper.cleanIndex(VSSIndexHelper.java:90)
at com.arecavss.plugin.ArecaVSSConfigurationAddon.ensureVSSSnapshots(ArecaVSSConfigurationAddon.java:132)
at com.arecavss.plugin.ArecaVSSConfigurationAddon.open(ArecaVSSConfigurationAddon.java:65)
at com.application.areca.AbstractTarget.open(AbstractTarget.java:307)
at com.application.areca.impl.FileSystemTarget.open(FileSystemTarget.java:215)
at com.application.areca.AbstractTarget.processBackup(AbstractTarget.java:380)
at com.application.areca.ActionProxy.processBackupOnTarget(ActionProxy.java:98)
at com.application.areca.launcher.gui.Application$9.runCommand(Application.java:1329)
at com.application.areca.launcher.gui.Application$ProcessRunner.run(Application.java:1857)
at java.lang.Thread.run(Unknown Source)

16-01-21 10:19 - INFO - Creating shadow copies for target #330407229 (CloudBackup)
16-01-21 10:19 - INFO - Existing shadow copies :
16-01-21 10:19 - INFO - Retrieving shadow copies ...
16-01-21 10:19 - ERROR - com.application.areca.ApplicationException: Volume shadow copy error for drive f:\ null
at com.arecavss.plugin.ArecaVSSConfigurationAddon.ensureVSSSnapshot(ArecaVSSConfigurationAddon.java:203)
at com.arecavss.plugin.ArecaVSSConfigurationAddon.ensureVSSSnapshots(ArecaVSSConfigurationAddon.java:154)
at com.arecavss.plugin.ArecaVSSConfigurationAddon.open(ArecaVSSConfigurationAddon.java:65)
at com.application.areca.AbstractTarget.open(AbstractTarget.java:307)
at com.application.areca.impl.FileSystemTarget.open(FileSystemTarget.java:215)
at com.application.areca.AbstractTarget.processBackup(AbstractTarget.java:380)
at com.application.areca.ActionProxy.processBackupOnTarget(ActionProxy.java:98)
at com.application.areca.launcher.gui.Application$9.runCommand(Application.java:1329)
at com.application.areca.launcher.gui.Application$ProcessRunner.run(Application.java:1857)
at java.lang.Thread.run(Unknown Source)
Caused by: java.lang.NullPointerException
at com.arecavss.plugin.VSSIndexHelper.cleanShadowCopies(VSSIndexHelper.java:114)
at com.arecavss.plugin.ArecaVSSConfigurationAddon.ensureVSSSnapshot(ArecaVSSConfigurationAddon.java:171)
... 9 more

16-01-21 10:19 - INFO - Aborting backup ...
16-01-21 10:19 - INFO - Abort completed.
16-01-21 10:19 - INFO - Backup completed.
16-01-21 10:19 - INFO - Backup completed on CloudBackup (330407229)
16-01-21 10:20 - INFO - Physical View - Looking for archives in R:/backup/330407229
16-01-21 10:23 - INFO - Closing Areca's main window ...
16-01-21 10:23 - INFO - Closing Areca (force=false)
16-01-21 10:23 - INFO - Closing Areca (force=false)
User #976 - 2016-01-21 17:27
Closed unresolved :(
User #976 - 2016-10-03 19:38
This CMD script looks more promising: https://sourceforge.net/p/areca/discussion/587585/thread/1c29a164/

I wish Areca would just bake this feature into the make program so we wouldn't have to rely on third parties that have stagnated development.
User #976 - 2016-10-03 19:39
Add comment :
Token ID (provided to you in the verification email) :