com.atlassian.stash.internal.backup.CanceledBackupException: The backup has been canceled.

Atlassian JIRA | Andrew Er | 11 months ago
  1. 0

    h1. Reproduce the problem: * Using Disk Management split the drive into two partition * Mount the Home Directory directly on B:\ (as an example) * Launch BBS and it should start correctly * Start the backup using BBSBC 2.0.1 (Have not tested previous versions) and it fails with the below trace Note that this is not a network mapped drive - it is all on the same HD. A sample output: {noformat} C:\Users\admin\Desktop\bitbucket-backup-distribution-2.0.2\bitbucket-backup-client-2.0.2>java -jar bitbucket-backup-client.jar 2016-01-14 22:59:30,183 INFO Initializing 2016-01-14 22:59:33,615 INFO Using Bitbucket 4.0.3 2016-01-14 22:59:33,990 INFO Contacting Bitbucket 2016-01-14 22:59:34,208 INFO Bitbucket has been locked for maintenance. It may be unlocked with token: 88b970fc369aa64b1a5186053e60922bb58ed 2016-01-14 22:59:34,505 INFO Starting database backup on Bitbucket. It may be cancelled with token: 01fc90dbb57b16befafd2715a1965c5f0385d 2016-01-14 22:59:38,327 INFO (50%) Now scanning B:\ 2016-01-14 22:59:38,373 INFO (50%) Cancelling database backup with code: 01fc90dbb57b16befafd2715a1965c5f037eb85d 2016-01-14 22:59:38,436 INFO (50%) Unlocking Bitbucket using token: 88b970fc369aa64b1a5186053e60922122bb58ed 2016-01-14 22:59:38,483 ERROR (50%) A backup could not be created. Reason: null java.lang.NullPointerException: null at sun.nio.fs.WindowsPath.toWindowsPath(Unknown Source) ~[na:1.8.0_60] at sun.nio.fs.WindowsPath.relativize(Unknown Source) ~[na:1.8.0_60] ... 19 more frames available in the log file {noformat} {noformat} 2016-01-14 23:27:28,622 INFO [cached4] c.a.s.i.m.DefaultMaintenanceService The system has been locked for maintenance. It may be unlocked with token: 2d74fad0c1ae428c898c6ef6a606c4f47807d3a8 2016-01-14 23:27:28,638 DEBUG [hz.hazelcast.async.thread-1] c.a.s.i.m.ClusterMaintenanceLock$FailureTrackingCallback Success executing on Member [172.16.195.129]:5701 this. Result: null 2016-01-14 23:27:28,638 DEBUG [hz.hazelcast.async.thread-1] c.a.s.i.m.ClusterMaintenanceLock$FailureTrackingCallback Execution complete. Successful - true 2016-01-14 23:27:28,685 DEBUG [http-nio-7990-exec-8] @ZT1F9Vx1407x49x0 127.0.0.1 "POST /mvc/admin/backups HTTP/1.1" c.a.s.i.s.s.PluginAuthenticationProvider attempting authentication with authenticator com.atlassian.bitbucket.server.bitbucket-crowd-sso:crowdSsoAuthHandler 2016-01-14 23:27:28,731 DEBUG [http-nio-7990-exec-8] @ZT1F9Vx1407x49x0 127.0.0.1 "POST /mvc/admin/backups HTTP/1.1" c.a.b.i.c.s.CrowdSsoAuthenticationHandler Skipping Crowd SSO as it is not enabled 2016-01-14 23:27:28,731 DEBUG [http-nio-7990-exec-8] @ZT1F9Vx1407x49x0 127.0.0.1 "POST /mvc/admin/backups HTTP/1.1" c.a.s.i.s.s.PluginAuthenticationProvider attempting authentication with authenticator com.atlassian.bitbucket.server.bitbucket-authentication:crowdHttpAuthHandler 2016-01-14 23:27:28,731 DEBUG [http-nio-7990-exec-8] @ZT1F9Vx1407x49x0 127.0.0.1 "POST /mvc/admin/backups HTTP/1.1" c.a.s.i.user.DefaultUserService Authenticating user: stash_admin 2016-01-14 23:27:28,794 DEBUG [http-nio-7990-exec-8] @ZT1F9Vx1407x49x0 127.0.0.1 "POST /mvc/admin/backups HTTP/1.1" c.a.s.i.a.PluginHttpAuthenticationSuccessHandler onAuthenticationSuccess - delegating to com.atlassian.stash.internal.user.RecentlyAccessedRepositoriesAuthenticationSuccessHandler 2016-01-14 23:27:28,794 DEBUG [http-nio-7990-exec-8] @ZT1F9Vx1407x49x0 127.0.0.1 "POST /mvc/admin/backups HTTP/1.1" c.a.s.i.a.PluginHttpAuthenticationSuccessHandler onAuthenticationSuccess - delegating to com.atlassian.stash.internal.auth.RememberMeAuthenticationSuccessHandler 2016-01-14 23:27:28,809 DEBUG [http-nio-7990-exec-8] @ZT1F9Vx1407x49x0 127.0.0.1 "POST /mvc/admin/backups HTTP/1.1" c.a.s.i.a.PluginHttpAuthenticationSuccessHandler onAuthenticationSuccess - delegating to com.atlassian.bitbucket.internal.crowd.sso.CrowdSsoAuthenticationHandler 2016-01-14 23:27:28,809 DEBUG [http-nio-7990-exec-8] @ZT1F9Vx1407x49x0 127.0.0.1 "POST /mvc/admin/backups HTTP/1.1" c.a.s.i.a.PluginHttpAuthenticationSuccessHandler onAuthenticationSuccess - delegating to com.atlassian.stash.internal.auth.SessionCreatingAuthenticationSuccessHandler 2016-01-14 23:27:28,809 DEBUG [http-nio-7990-exec-8] @ZT1F9Vx1407x49x0 127.0.0.1 "POST /mvc/admin/backups HTTP/1.1" c.a.s.i.a.PluginHttpAuthenticationSuccessHandler onAuthenticationSuccess - delegating to com.atlassian.stash.internal.auth.RedirectingAuthenticationSuccessHandler 2016-01-14 23:27:28,809 DEBUG [http-nio-7990-exec-8] @ZT1F9Vx1407x49x0 127.0.0.1 "POST /mvc/admin/backups HTTP/1.1" c.a.s.i.a.PluginHttpAuthenticationSuccessHandler onAuthenticationSuccess - none of the plugins handled authentication success 2016-01-14 23:27:28,934 INFO [http-nio-7990-exec-8] stash_admin @ZT1F9Vx1407x49x0 127.0.0.1 "POST /mvc/admin/backups HTTP/1.1" c.a.s.i.m.DefaultMaintenanceService BACKUP started. It may be canceled with token: 40534432c7f71dfaf0cb5c87ac2dfca69cb9a81c 2016-01-14 23:27:28,981 DEBUG [threadpool:thread-1] stash_admin @ZT1F9Vx1407x49x0 127.0.0.1 "POST /mvc/admin/backups HTTP/1.1" c.a.s.i.m.backup.BackupPhase Writing backup to B:\export\backup-stash_admin-20160114-152728-981Z.zip 2016-01-14 23:27:29,121 DEBUG [threadpool:thread-1] stash_admin @ZT1F9Vx1407x49x0 127.0.0.1 "POST /mvc/admin/backups HTTP/1.1" c.a.s.i.m.b.ChangelogsBackupStep Backing up database changelogs to changelogs.zip 2016-01-14 23:27:29,277 INFO [hz.hazelcast.event-3] org.quartz.core.QuartzScheduler Scheduler localScheduler_$_NON_CLUSTERED paused. 2016-01-14 23:27:29,277 INFO [hz.hazelcast.event-3] org.quartz.core.QuartzScheduler Scheduler clusterScheduler_$_NON_CLUSTERED paused. 2016-01-14 23:27:29,917 DEBUG [threadpool:thread-1] stash_admin @ZT1F9Vx1407x49x0 127.0.0.1 "POST /mvc/admin/backups HTTP/1.1" c.a.s.i.m.LatchAndDrainDatabaseBackupStep Latching DataSource 2016-01-14 23:27:29,948 DEBUG [threadpool:thread-1] stash_admin @ZT1F9Vx1407x49x0 127.0.0.1 "POST /mvc/admin/backups HTTP/1.1" c.a.s.i.m.LatchAndDrainDatabaseBackupStep Draining DataSource 2016-01-14 23:27:29,948 DEBUG [threadpool:thread-1] stash_admin @ZT1F9Vx1407x49x0 127.0.0.1 "POST /mvc/admin/backups HTTP/1.1" c.a.s.i.h.ExtendedHikariDataSource Draining the database pool 2016-01-14 23:27:29,948 DEBUG [threadpool:thread-1] stash_admin @ZT1F9Vx1407x49x0 127.0.0.1 "POST /mvc/admin/backups HTTP/1.1" c.a.s.i.h.ExtendedHikariDataSource The database pool has drained in 0ms 2016-01-14 23:27:29,948 DEBUG [threadpool:thread-1] stash_admin @ZT1F9Vx1407x49x0 127.0.0.1 "POST /mvc/admin/backups HTTP/1.1" c.a.s.i.db.DefaultDatabaseManager The DataSource has been drained 2016-01-14 23:27:29,948 DEBUG [threadpool:thread-1] stash_admin @ZT1F9Vx1407x49x0 127.0.0.1 "POST /mvc/admin/backups HTTP/1.1" c.a.s.i.m.LatchAndDrainDatabaseBackupStep Successfully drained the DataSource 2016-01-14 23:27:29,948 DEBUG [threadpool:thread-1] stash_admin @ZT1F9Vx1407x49x0 127.0.0.1 "POST /mvc/admin/backups HTTP/1.1" c.a.s.i.m.LatchAndDrainScmStep Latching SCMs 2016-01-14 23:27:29,948 DEBUG [threadpool:thread-1] stash_admin @ZT1F9Vx1407x49x0 127.0.0.1 "POST /mvc/admin/backups HTTP/1.1" c.a.s.i.m.LatchAndDrainScmStep Draining SCMs 2016-01-14 23:27:29,948 DEBUG [threadpool:thread-1] stash_admin @ZT1F9Vx1407x49x0 127.0.0.1 "POST /mvc/admin/backups HTTP/1.1" c.a.s.internal.scm.PluginScmService Draining SCMs with timeout of 60000ms 2016-01-14 23:27:29,964 DEBUG [threadpool:thread-1] stash_admin @ZT1F9Vx1407x49x0 127.0.0.1 "POST /mvc/admin/backups HTTP/1.1" c.a.s.internal.scm.PluginScmService Draining SCM com.atlassian.stash.internal.scm.git.DefaultGitScm@39afcffb 2016-01-14 23:27:29,964 DEBUG [threadpool:thread-1] stash_admin @ZT1F9Vx1407x49x0 127.0.0.1 "POST /mvc/admin/backups HTTP/1.1" c.a.s.i.m.LatchAndDrainScmStep Successfully drained the SCMs 2016-01-14 23:27:29,964 DEBUG [threadpool:thread-1] stash_admin @ZT1F9Vx1407x49x0 127.0.0.1 "POST /mvc/admin/backups HTTP/1.1" c.a.s.i.m.backup.DatabaseBackupStep Backing up Bitbucket data to stash-data.xml 2016-01-14 23:27:29,964 INFO [threadpool:thread-1] stash_admin @ZT1F9Vx1407x49x0 127.0.0.1 "POST /mvc/admin/backups HTTP/1.1" c.a.s.i.b.l.DefaultLiquibaseMigrationDao Backup process started 2016-01-14 23:27:30,338 INFO [threadpool:thread-1] stash_admin @ZT1F9Vx1407x49x0 127.0.0.1 "POST /mvc/admin/backups HTTP/1.1" c.a.s.i.b.l.DefaultLiquibaseSession Examining structure of source database 2016-01-14 23:27:31,992 DEBUG [threadpool:thread-1] stash_admin @ZT1F9Vx1407x49x0 127.0.0.1 "POST /mvc/admin/backups HTTP/1.1" c.a.s.i.b.l.DefaultLiquibaseDao Unlocking Liquibase 2016-01-14 23:27:31,992 DEBUG [threadpool:thread-1] stash_admin @ZT1F9Vx1407x49x0 127.0.0.1 "POST /mvc/admin/backups HTTP/1.1" c.a.s.i.b.l.DefaultLiquibaseDao Liquibase unlocked 2016-01-14 23:27:31,992 DEBUG [threadpool:thread-1] stash_admin @ZT1F9Vx1407x49x0 127.0.0.1 "POST /mvc/admin/backups HTTP/1.1" c.a.s.i.b.l.DefaultLiquibaseSession Closing Liquibase 2016-01-14 23:27:31,992 DEBUG [threadpool:thread-1] stash_admin @ZT1F9Vx1407x49x0 127.0.0.1 "POST /mvc/admin/backups HTTP/1.1" c.a.s.i.b.l.DefaultLiquibaseSession Liquibase closed 2016-01-14 23:27:31,992 DEBUG [threadpool:thread-1] stash_admin @ZT1F9Vx1407x49x0 127.0.0.1 "POST /mvc/admin/backups HTTP/1.1" c.a.s.i.m.backup.BackupPhase Deleted partial backup file at B:\export\backup-stash_admin-20160114-152728-981Z.zip after catching an exception 2016-01-14 23:27:32,023 WARN [threadpool:thread-1] stash_admin @ZT1F9Vx1407x49x0 127.0.0.1 "POST /mvc/admin/backups HTTP/1.1" c.a.s.i.m.DefaultMaintenanceTaskMonitor BACKUP maintenance has been canceled (Cause: CanceledBackupException: The backup has been canceled.) com.atlassian.stash.internal.backup.CanceledBackupException: The backup has been canceled. at com.atlassian.stash.internal.maintenance.backup.AbstractBackupTask.run(AbstractBackupTask.java:89) ~[bitbucket-service-impl-4.0.3.jar:na] at com.atlassian.stash.internal.maintenance.DefaultMaintenanceTaskMonitor.run(DefaultMaintenanceTaskMonitor.java:212) ~[bitbucket-service-impl-4.0.3.jar:na] at java.util.concurrent.Executors$RunnableAdapter.call(Unknown Source) [na:1.8.0_60] at java.util.concurrent.FutureTask.run(Unknown Source) [na:1.8.0_60] at com.atlassian.stash.internal.concurrent.StateTransferringExecutor$StateTransferringRunnable.run(StateTransferringExecutor.java:73) [bitbucket-platform-4.0.3.jar:na] at java.util.concurrent.Executors$RunnableAdapter.call(Unknown Source) [na:1.8.0_60] at java.util.concurrent.FutureTask.run(Unknown Source) [na:1.8.0_60] at java.util.concurrent.ScheduledThreadPoolExecutor$ScheduledFutureTask.access$201(Unknown Source) [na:1.8.0_60] at java.util.concurrent.ScheduledThreadPoolExecutor$ScheduledFutureTask.run(Unknown Source) [na:1.8.0_60] at java.util.concurrent.ThreadPoolExecutor.runWorker(Unknown Source) [na:1.8.0_60] at java.lang.Thread.run(Unknown Source) [na:1.8.0_60] ... 1 frame trimmed {noformat} h1. Workaround: The workaround is to place the home directory into a directory of that drive like B:\bitbucket-home and the backup will work perfectly fine after that.

    Atlassian JIRA | 11 months ago | Andrew Er [Atlassian]
    com.atlassian.stash.internal.backup.CanceledBackupException: The backup has been canceled.
  2. 0

    h1. Reproduce the problem: * Using Disk Management split the drive into two partition * Mount the Home Directory directly on B:\ (as an example) * Launch BBS and it should start correctly * Start the backup using BBSBC 2.0.1 (Have not tested previous versions) and it fails with the below trace Note that this is not a network mapped drive - it is all on the same HD. A sample output: {noformat} C:\Users\admin\Desktop\bitbucket-backup-distribution-2.0.2\bitbucket-backup-client-2.0.2>java -jar bitbucket-backup-client.jar 2016-01-14 22:59:30,183 INFO Initializing 2016-01-14 22:59:33,615 INFO Using Bitbucket 4.0.3 2016-01-14 22:59:33,990 INFO Contacting Bitbucket 2016-01-14 22:59:34,208 INFO Bitbucket has been locked for maintenance. It may be unlocked with token: 88b970fc369aa64b1a5186053e60922bb58ed 2016-01-14 22:59:34,505 INFO Starting database backup on Bitbucket. It may be cancelled with token: 01fc90dbb57b16befafd2715a1965c5f0385d 2016-01-14 22:59:38,327 INFO (50%) Now scanning B:\ 2016-01-14 22:59:38,373 INFO (50%) Cancelling database backup with code: 01fc90dbb57b16befafd2715a1965c5f037eb85d 2016-01-14 22:59:38,436 INFO (50%) Unlocking Bitbucket using token: 88b970fc369aa64b1a5186053e60922122bb58ed 2016-01-14 22:59:38,483 ERROR (50%) A backup could not be created. Reason: null java.lang.NullPointerException: null at sun.nio.fs.WindowsPath.toWindowsPath(Unknown Source) ~[na:1.8.0_60] at sun.nio.fs.WindowsPath.relativize(Unknown Source) ~[na:1.8.0_60] ... 19 more frames available in the log file {noformat} {noformat} 2016-01-14 23:27:28,622 INFO [cached4] c.a.s.i.m.DefaultMaintenanceService The system has been locked for maintenance. It may be unlocked with token: 2d74fad0c1ae428c898c6ef6a606c4f47807d3a8 2016-01-14 23:27:28,638 DEBUG [hz.hazelcast.async.thread-1] c.a.s.i.m.ClusterMaintenanceLock$FailureTrackingCallback Success executing on Member [172.16.195.129]:5701 this. Result: null 2016-01-14 23:27:28,638 DEBUG [hz.hazelcast.async.thread-1] c.a.s.i.m.ClusterMaintenanceLock$FailureTrackingCallback Execution complete. Successful - true 2016-01-14 23:27:28,685 DEBUG [http-nio-7990-exec-8] @ZT1F9Vx1407x49x0 127.0.0.1 "POST /mvc/admin/backups HTTP/1.1" c.a.s.i.s.s.PluginAuthenticationProvider attempting authentication with authenticator com.atlassian.bitbucket.server.bitbucket-crowd-sso:crowdSsoAuthHandler 2016-01-14 23:27:28,731 DEBUG [http-nio-7990-exec-8] @ZT1F9Vx1407x49x0 127.0.0.1 "POST /mvc/admin/backups HTTP/1.1" c.a.b.i.c.s.CrowdSsoAuthenticationHandler Skipping Crowd SSO as it is not enabled 2016-01-14 23:27:28,731 DEBUG [http-nio-7990-exec-8] @ZT1F9Vx1407x49x0 127.0.0.1 "POST /mvc/admin/backups HTTP/1.1" c.a.s.i.s.s.PluginAuthenticationProvider attempting authentication with authenticator com.atlassian.bitbucket.server.bitbucket-authentication:crowdHttpAuthHandler 2016-01-14 23:27:28,731 DEBUG [http-nio-7990-exec-8] @ZT1F9Vx1407x49x0 127.0.0.1 "POST /mvc/admin/backups HTTP/1.1" c.a.s.i.user.DefaultUserService Authenticating user: stash_admin 2016-01-14 23:27:28,794 DEBUG [http-nio-7990-exec-8] @ZT1F9Vx1407x49x0 127.0.0.1 "POST /mvc/admin/backups HTTP/1.1" c.a.s.i.a.PluginHttpAuthenticationSuccessHandler onAuthenticationSuccess - delegating to com.atlassian.stash.internal.user.RecentlyAccessedRepositoriesAuthenticationSuccessHandler 2016-01-14 23:27:28,794 DEBUG [http-nio-7990-exec-8] @ZT1F9Vx1407x49x0 127.0.0.1 "POST /mvc/admin/backups HTTP/1.1" c.a.s.i.a.PluginHttpAuthenticationSuccessHandler onAuthenticationSuccess - delegating to com.atlassian.stash.internal.auth.RememberMeAuthenticationSuccessHandler 2016-01-14 23:27:28,809 DEBUG [http-nio-7990-exec-8] @ZT1F9Vx1407x49x0 127.0.0.1 "POST /mvc/admin/backups HTTP/1.1" c.a.s.i.a.PluginHttpAuthenticationSuccessHandler onAuthenticationSuccess - delegating to com.atlassian.bitbucket.internal.crowd.sso.CrowdSsoAuthenticationHandler 2016-01-14 23:27:28,809 DEBUG [http-nio-7990-exec-8] @ZT1F9Vx1407x49x0 127.0.0.1 "POST /mvc/admin/backups HTTP/1.1" c.a.s.i.a.PluginHttpAuthenticationSuccessHandler onAuthenticationSuccess - delegating to com.atlassian.stash.internal.auth.SessionCreatingAuthenticationSuccessHandler 2016-01-14 23:27:28,809 DEBUG [http-nio-7990-exec-8] @ZT1F9Vx1407x49x0 127.0.0.1 "POST /mvc/admin/backups HTTP/1.1" c.a.s.i.a.PluginHttpAuthenticationSuccessHandler onAuthenticationSuccess - delegating to com.atlassian.stash.internal.auth.RedirectingAuthenticationSuccessHandler 2016-01-14 23:27:28,809 DEBUG [http-nio-7990-exec-8] @ZT1F9Vx1407x49x0 127.0.0.1 "POST /mvc/admin/backups HTTP/1.1" c.a.s.i.a.PluginHttpAuthenticationSuccessHandler onAuthenticationSuccess - none of the plugins handled authentication success 2016-01-14 23:27:28,934 INFO [http-nio-7990-exec-8] stash_admin @ZT1F9Vx1407x49x0 127.0.0.1 "POST /mvc/admin/backups HTTP/1.1" c.a.s.i.m.DefaultMaintenanceService BACKUP started. It may be canceled with token: 40534432c7f71dfaf0cb5c87ac2dfca69cb9a81c 2016-01-14 23:27:28,981 DEBUG [threadpool:thread-1] stash_admin @ZT1F9Vx1407x49x0 127.0.0.1 "POST /mvc/admin/backups HTTP/1.1" c.a.s.i.m.backup.BackupPhase Writing backup to B:\export\backup-stash_admin-20160114-152728-981Z.zip 2016-01-14 23:27:29,121 DEBUG [threadpool:thread-1] stash_admin @ZT1F9Vx1407x49x0 127.0.0.1 "POST /mvc/admin/backups HTTP/1.1" c.a.s.i.m.b.ChangelogsBackupStep Backing up database changelogs to changelogs.zip 2016-01-14 23:27:29,277 INFO [hz.hazelcast.event-3] org.quartz.core.QuartzScheduler Scheduler localScheduler_$_NON_CLUSTERED paused. 2016-01-14 23:27:29,277 INFO [hz.hazelcast.event-3] org.quartz.core.QuartzScheduler Scheduler clusterScheduler_$_NON_CLUSTERED paused. 2016-01-14 23:27:29,917 DEBUG [threadpool:thread-1] stash_admin @ZT1F9Vx1407x49x0 127.0.0.1 "POST /mvc/admin/backups HTTP/1.1" c.a.s.i.m.LatchAndDrainDatabaseBackupStep Latching DataSource 2016-01-14 23:27:29,948 DEBUG [threadpool:thread-1] stash_admin @ZT1F9Vx1407x49x0 127.0.0.1 "POST /mvc/admin/backups HTTP/1.1" c.a.s.i.m.LatchAndDrainDatabaseBackupStep Draining DataSource 2016-01-14 23:27:29,948 DEBUG [threadpool:thread-1] stash_admin @ZT1F9Vx1407x49x0 127.0.0.1 "POST /mvc/admin/backups HTTP/1.1" c.a.s.i.h.ExtendedHikariDataSource Draining the database pool 2016-01-14 23:27:29,948 DEBUG [threadpool:thread-1] stash_admin @ZT1F9Vx1407x49x0 127.0.0.1 "POST /mvc/admin/backups HTTP/1.1" c.a.s.i.h.ExtendedHikariDataSource The database pool has drained in 0ms 2016-01-14 23:27:29,948 DEBUG [threadpool:thread-1] stash_admin @ZT1F9Vx1407x49x0 127.0.0.1 "POST /mvc/admin/backups HTTP/1.1" c.a.s.i.db.DefaultDatabaseManager The DataSource has been drained 2016-01-14 23:27:29,948 DEBUG [threadpool:thread-1] stash_admin @ZT1F9Vx1407x49x0 127.0.0.1 "POST /mvc/admin/backups HTTP/1.1" c.a.s.i.m.LatchAndDrainDatabaseBackupStep Successfully drained the DataSource 2016-01-14 23:27:29,948 DEBUG [threadpool:thread-1] stash_admin @ZT1F9Vx1407x49x0 127.0.0.1 "POST /mvc/admin/backups HTTP/1.1" c.a.s.i.m.LatchAndDrainScmStep Latching SCMs 2016-01-14 23:27:29,948 DEBUG [threadpool:thread-1] stash_admin @ZT1F9Vx1407x49x0 127.0.0.1 "POST /mvc/admin/backups HTTP/1.1" c.a.s.i.m.LatchAndDrainScmStep Draining SCMs 2016-01-14 23:27:29,948 DEBUG [threadpool:thread-1] stash_admin @ZT1F9Vx1407x49x0 127.0.0.1 "POST /mvc/admin/backups HTTP/1.1" c.a.s.internal.scm.PluginScmService Draining SCMs with timeout of 60000ms 2016-01-14 23:27:29,964 DEBUG [threadpool:thread-1] stash_admin @ZT1F9Vx1407x49x0 127.0.0.1 "POST /mvc/admin/backups HTTP/1.1" c.a.s.internal.scm.PluginScmService Draining SCM com.atlassian.stash.internal.scm.git.DefaultGitScm@39afcffb 2016-01-14 23:27:29,964 DEBUG [threadpool:thread-1] stash_admin @ZT1F9Vx1407x49x0 127.0.0.1 "POST /mvc/admin/backups HTTP/1.1" c.a.s.i.m.LatchAndDrainScmStep Successfully drained the SCMs 2016-01-14 23:27:29,964 DEBUG [threadpool:thread-1] stash_admin @ZT1F9Vx1407x49x0 127.0.0.1 "POST /mvc/admin/backups HTTP/1.1" c.a.s.i.m.backup.DatabaseBackupStep Backing up Bitbucket data to stash-data.xml 2016-01-14 23:27:29,964 INFO [threadpool:thread-1] stash_admin @ZT1F9Vx1407x49x0 127.0.0.1 "POST /mvc/admin/backups HTTP/1.1" c.a.s.i.b.l.DefaultLiquibaseMigrationDao Backup process started 2016-01-14 23:27:30,338 INFO [threadpool:thread-1] stash_admin @ZT1F9Vx1407x49x0 127.0.0.1 "POST /mvc/admin/backups HTTP/1.1" c.a.s.i.b.l.DefaultLiquibaseSession Examining structure of source database 2016-01-14 23:27:31,992 DEBUG [threadpool:thread-1] stash_admin @ZT1F9Vx1407x49x0 127.0.0.1 "POST /mvc/admin/backups HTTP/1.1" c.a.s.i.b.l.DefaultLiquibaseDao Unlocking Liquibase 2016-01-14 23:27:31,992 DEBUG [threadpool:thread-1] stash_admin @ZT1F9Vx1407x49x0 127.0.0.1 "POST /mvc/admin/backups HTTP/1.1" c.a.s.i.b.l.DefaultLiquibaseDao Liquibase unlocked 2016-01-14 23:27:31,992 DEBUG [threadpool:thread-1] stash_admin @ZT1F9Vx1407x49x0 127.0.0.1 "POST /mvc/admin/backups HTTP/1.1" c.a.s.i.b.l.DefaultLiquibaseSession Closing Liquibase 2016-01-14 23:27:31,992 DEBUG [threadpool:thread-1] stash_admin @ZT1F9Vx1407x49x0 127.0.0.1 "POST /mvc/admin/backups HTTP/1.1" c.a.s.i.b.l.DefaultLiquibaseSession Liquibase closed 2016-01-14 23:27:31,992 DEBUG [threadpool:thread-1] stash_admin @ZT1F9Vx1407x49x0 127.0.0.1 "POST /mvc/admin/backups HTTP/1.1" c.a.s.i.m.backup.BackupPhase Deleted partial backup file at B:\export\backup-stash_admin-20160114-152728-981Z.zip after catching an exception 2016-01-14 23:27:32,023 WARN [threadpool:thread-1] stash_admin @ZT1F9Vx1407x49x0 127.0.0.1 "POST /mvc/admin/backups HTTP/1.1" c.a.s.i.m.DefaultMaintenanceTaskMonitor BACKUP maintenance has been canceled (Cause: CanceledBackupException: The backup has been canceled.) com.atlassian.stash.internal.backup.CanceledBackupException: The backup has been canceled. at com.atlassian.stash.internal.maintenance.backup.AbstractBackupTask.run(AbstractBackupTask.java:89) ~[bitbucket-service-impl-4.0.3.jar:na] at com.atlassian.stash.internal.maintenance.DefaultMaintenanceTaskMonitor.run(DefaultMaintenanceTaskMonitor.java:212) ~[bitbucket-service-impl-4.0.3.jar:na] at java.util.concurrent.Executors$RunnableAdapter.call(Unknown Source) [na:1.8.0_60] at java.util.concurrent.FutureTask.run(Unknown Source) [na:1.8.0_60] at com.atlassian.stash.internal.concurrent.StateTransferringExecutor$StateTransferringRunnable.run(StateTransferringExecutor.java:73) [bitbucket-platform-4.0.3.jar:na] at java.util.concurrent.Executors$RunnableAdapter.call(Unknown Source) [na:1.8.0_60] at java.util.concurrent.FutureTask.run(Unknown Source) [na:1.8.0_60] at java.util.concurrent.ScheduledThreadPoolExecutor$ScheduledFutureTask.access$201(Unknown Source) [na:1.8.0_60] at java.util.concurrent.ScheduledThreadPoolExecutor$ScheduledFutureTask.run(Unknown Source) [na:1.8.0_60] at java.util.concurrent.ThreadPoolExecutor.runWorker(Unknown Source) [na:1.8.0_60] at java.lang.Thread.run(Unknown Source) [na:1.8.0_60] ... 1 frame trimmed {noformat} h1. Workaround: The workaround is to place the home directory into a directory of that drive like B:\bitbucket-home and the backup will work perfectly fine after that.

    Atlassian JIRA | 11 months ago | Andrew Er
    com.atlassian.stash.internal.backup.CanceledBackupException: The backup has been canceled.

    Root Cause Analysis

    1. com.atlassian.stash.internal.backup.CanceledBackupException

      The backup has been canceled.

      at com.atlassian.stash.internal.maintenance.backup.AbstractBackupTask.run()
    2. com.atlassian.stash
      DefaultMaintenanceTaskMonitor.run
      1. com.atlassian.stash.internal.maintenance.backup.AbstractBackupTask.run(AbstractBackupTask.java:89)[bitbucket-service-impl-4.0.3.jar:na]
      2. com.atlassian.stash.internal.maintenance.DefaultMaintenanceTaskMonitor.run(DefaultMaintenanceTaskMonitor.java:212)[bitbucket-service-impl-4.0.3.jar:na]
      2 frames
    3. Java RT
      FutureTask.run
      1. java.util.concurrent.Executors$RunnableAdapter.call(Unknown Source)[na:1.8.0_60]
      2. java.util.concurrent.FutureTask.run(Unknown Source)[na:1.8.0_60]
      2 frames
    4. com.atlassian.stash
      StateTransferringExecutor$StateTransferringRunnable.run
      1. com.atlassian.stash.internal.concurrent.StateTransferringExecutor$StateTransferringRunnable.run(StateTransferringExecutor.java:73)[bitbucket-platform-4.0.3.jar:na]
      1 frame
    5. Java RT
      Thread.run
      1. java.util.concurrent.Executors$RunnableAdapter.call(Unknown Source)[na:1.8.0_60]
      2. java.util.concurrent.FutureTask.run(Unknown Source)[na:1.8.0_60]
      3. java.util.concurrent.ScheduledThreadPoolExecutor$ScheduledFutureTask.access$201(Unknown Source)[na:1.8.0_60]
      4. java.util.concurrent.ScheduledThreadPoolExecutor$ScheduledFutureTask.run(Unknown Source)[na:1.8.0_60]
      5. java.util.concurrent.ThreadPoolExecutor.runWorker(Unknown Source)[na:1.8.0_60]
      6. java.lang.Thread.run(Unknown Source)[na:1.8.0_60]
      6 frames