I'm using Bareos since two years. Now as version 16.2.4 is available I'm testing
the new Always Incremental feature.
I have configured mhvtl based virtual library, and bareos as described in the
manual for operating systems CentOS 6, CentOS 7, SLES12SP1. The functionality
of mhvtl was successfully tested with mtx and btape.
After three weeks I had problems running the consolidation job. Bareos needs a
volume from the consolidated pool in one drive, but it's in use in the other
one.
Therefore the Consolidation Jobs fails. This behavior is shown on all tested
operating systems.
I think that the reason for the error is a reservation conflict of the
storage-drive in bareos or a configuration error.
What's going wrong?
The following lines shows the configuration and messages during incremental
and consolidation backups.
###########################################################################
Appl: Bareos 16.2.4 or 13.2.1
OS: CentOS 6.8 or SLES12SP1
Configuration
### Bareos-DIR ################################
### /etc/bareos/bareos-dir.d/client
Client {
Name = BackupClient
FDPort = 9102
Address = bareos01
Password = "2WC5oomuhiDYZ0Qd2HpfNJGIrb1xyFKGIA4KiNUtPYuJ"
Enabled = yes
}
### /etc/bareos/bareos-dir.d/fileset
Fileset {
Name = "SelfTest"
Description = "fileset just to backup some files for selftest"
Include {
Options {
Signature = MD5 # calculate md5 checksum per file
}
File = "/var/log"
}
}
### /etc/bareos/bareos-dir.d/jobdefs
JobDefs {
Name = "DailyJob"
Type = Backup
Level = Incremental
# Always incremental settings
AlwaysIncremental = yes
AlwaysIncrementalJobRetention = 7d
AlwaysIncrementalKeepNumber = 3
AlwaysIncrementalMaxFullAge = 14d
Accurate = yes
Pool = AI-Incremental
Full Backup Pool = AI-Consolidated
#
Schedule = "DailyBackup"
Messages = Standard
Priority = 10
Write Bootstrap = "/var/lib/bareos/%c.bsr"
# Spooling
SpoolData = no
}
JobDefs {
Name = "DailyConsolidateJob"
Type = Consolidate
Accurate = yes
Max Full Consolidations = 1
#
Pool = AI-Consolidated
Write Bootstrap = "/var/lib/bareos/%c.bsr"
Schedule = "DailyConsolidate"
Messages = Standard
Priority = 10
}
### /etc/bareos/bareos-dir.d/job
Job {
Name = "BackupClient-B"
Description = "Daily Always Incremental Job"
JobDefs = "DailyJob"
Client = BackupClient
FileSet = "SelfTest"
}
Job {
Name = "BackupClient-C"
Description = "Daily Consolidation Job"
JobDefs = "DailyConsolidateJob"
Client = BackupClient
FileSet = "SelfTest"
}
### /etc/bareos/bareos-dir.d/pool
Pool {
Name = AI-Incremental
Pool Type = Backup
Recycle = yes
AutoPrune = no
Volume Use Duration = 23h
Storage = vtl
Next Pool = AI-Consolidated
Recycle Pool = Scratch
ScratchPool = Scratch
}
Pool {
Name = AI-Consolidated
Pool Type = Backup
Recycle = yes
AutoPrune = no
Volume Use Duration = 23h
Storage = vtl
Next Pool = AI-Longterm
Recycle Pool = Scratch
ScratchPool = Scratch
}
Pool {
Name = Scratch
Pool Type = Backup
Storage = vtl
}
### /etc/bareos/bareos-dir.d/schedule
Schedule {
Enabled = yes
Name = "DailyBackup"
Run = mon-sun at 18:00
}
Schedule {
Enabled = yes
Name = "DailyConsolidate"
Run = mon-sun at 8:00
}
### /etc/bareos/bareos-dir.d/storage
Storage {
Name = vtl
Address = bareos01
Password = "KrigeXcmWYR6CqjLONM00loBdxHvNID1wXyL23l14lks"
Device = vtl
Autochanger = yes
Media Type = LTO4
Maximum Concurrent Jobs = 2
Maximum Concurrent Read Jobs = 1
}
### Bareos-SD ################################
### /etc/bareos/bareos-sd.d/autochanger
Autochanger {
Name = vtl
Device = Drive-0
Device = Drive-1
Changer Command = "/usr/lib/bareos/scripts/mtx-changer %c %o %S %a %d"
Changer Device = /dev/tape/by-id/scsi-350223344ab000000
}
### /etc/bareos/bareos-sd.d/device
Device {
Name = Drive-0
Drive Index = 0
Media Type = LTO4
Archive Device = /dev/tape/by-id/scsi-350223344ab000100-nst
AutomaticMount = yes;
AlwaysOpen = yes;
RemovableMedia = yes;
RandomAccess = no;
AutoChanger = yes
Alert Command = "sh -c 'tapeinfo -f %c |grep TapeAlert|cat'"
# Settings for mhvtl tape drives
Hardware End of Medium = No
Fast Forward Space File = No
}
Device {
Name = Drive-1
Drive Index = 1
Media Type = LTO4
Archive Device = /dev/tape/by-id/scsi-350223344ab000200-nst
AutomaticMount = yes;
AlwaysOpen = yes;
RemovableMedia = yes;
RandomAccess = no;
AutoChanger = yes
Alert Command = "sh -c 'tapeinfo -f %c |grep TapeAlert|cat'"
# Settings for mhvtl tape drives
Hardware End of Medium = No
Fast Forward Space File = No
}
### Commands ###
bconsole
update slots
label barcode
Run several Daily always incremental jobs on 100116
*list jobs
+-------+----------------+--------------+---------------------+------+-------+----------+-----------+-----------+
| jobid | name | client | starttime | type | level |
jobfiles | jobbytes | jobstatus |
+-------+----------------+--------------+---------------------+------+-------+----------+-----------+-----------+
| 1 | BackupClient-B | BackupClient | 2016-10-01 20:21:40 | B | F |
136 | 7,581,933 | T |
| 2 | BackupClient-B | BackupClient | 2016-10-01 20:22:40 | B | I |
4 | 65,891 | T |
| 3 | BackupClient-B | BackupClient | 2016-10-01 20:22:48 | B | I |
3 | 30,730 | T |
| 4 | BackupClient-B | BackupClient | 2016-10-01 20:22:52 | B | I |
2 | 35,466 | T |
| 5 | BackupClient-B | BackupClient | 2016-10-01 20:22:55 | B | I |
3 | 40,871 | T |
| 6 | BackupClient-B | BackupClient | 2016-10-01 20:22:56 | B | I |
2 | 45,436 | T |
| 7 | BackupClient-B | BackupClient | 2016-10-01 20:23:00 | B | I |
3 | 51,013 | T |
| 8 | BackupClient-B | BackupClient | 2016-10-01 20:23:01 | B | I |
2 | 55,406 | T |
| 9 | BackupClient-B | BackupClient | 2016-10-01 20:23:09 | B | I |
3 | 61,069 | T |
+-------+----------------+--------------+---------------------+------+-------+----------+-----------+-----------+
*list volumes
Pool: AI-Consolidated
+---------+------------+-----------+---------+-----------+----------+--------------+---------+------+-----------+-----------+---------------------+---------+
| mediaid | volumename | volstatus | enabled | volbytes | volfiles |
volretention | recycle | slot | inchanger | mediatype | lastwritten |
storage |
+---------+------------+-----------+---------+-----------+----------+--------------+---------+------+-----------+-----------+---------------------+---------+
| 1 | U02301L4 | Append | 1 | 7,606,255 | 1 |
31,536,000 | 1 | 1 | 1 | LTO4 | 2016-10-01 20:21:42 | vtl
|
+---------+------------+-----------+---------+-----------+----------+--------------+---------+------+-----------+-----------+---------------------+---------+
Pool: Scratch
+---------+------------+-----------+---------+----------+----------+--------------+---------+------+-----------+-----------+-------------+---------+
| mediaid | volumename | volstatus | enabled | volbytes | volfiles |
volretention | recycle | slot | inchanger | mediatype | lastwritten | storage |
+---------+------------+-----------+---------+----------+----------+--------------+---------+------+-----------+-----------+-------------+---------+
| 3 | U02303L4 | Append | 1 | 196 | 0 |
31,536,000 | 1 | 3 | 1 | LTO4 | | vtl |
| 4 | U02304L4 | Append | 1 | 196 | 0 |
31,536,000 | 1 | 4 | 1 | LTO4 | | vtl |
| 5 | U02305L4 | Append | 1 | 196 | 0 |
31,536,000 | 1 | 5 | 1 | LTO4 | | vtl |
| 6 | U02306L4 | Append | 1 | 196 | 0 |
31,536,000 | 1 | 6 | 1 | LTO4 | | vtl |
| 7 | U02307L4 | Append | 1 | 196 | 0 |
31,536,000 | 1 | 7 | 1 | LTO4 | | vtl |
| 8 | U02308L4 | Append | 1 | 196 | 0 |
31,536,000 | 1 | 8 | 1 | LTO4 | | vtl |
| 9 | U02309L4 | Append | 1 | 196 | 0 |
31,536,000 | 1 | 9 | 1 | LTO4 | | vtl |
| 10 | U02310L4 | Append | 1 | 196 | 0 |
31,536,000 | 1 | 10 | 1 | LTO4 | | vtl |
+---------+------------+-----------+---------+----------+----------+--------------+---------+------+-----------+-----------+-------------+---------+
Pool: AI-Incremental
+---------+------------+-----------+---------+----------+----------+--------------+---------+------+-----------+-----------+---------------------+---------+
| mediaid | volumename | volstatus | enabled | volbytes | volfiles |
volretention | recycle | slot | inchanger | mediatype | lastwritten |
storage |
+---------+------------+-----------+---------+----------+----------+--------------+---------+------+-----------+-----------+---------------------+---------+
| 2 | U02302L4 | Append | 1 | 392,727 | 8 |
31,536,000 | 1 | 2 | 1 | LTO4 | 2016-10-01 20:23:09 | vtl
|
+---------+------------+-----------+---------+----------+----------+--------------+---------+------+-----------+-----------+---------------------+---------+
Run consolidation job on 101016
*run job=job=BackupClient-C yes
10-Oct 20:29 bareos-dir JobId 10: Start Consolidate JobId 10,
Job=BackupClient-C.2016-10-10_20.29.44_14
10-Oct 20:29 bareos-dir JobId 10: Looking at always incremental job
BackupClient-B
10-Oct 20:29 bareos-dir JobId 10: BackupClient-B: considering jobs older than
03-Oct-2016 20:29:46 for consolidation.
10-Oct 20:29 bareos-dir JobId 10: before ConsolidateFull: jobids: 1,2,3,4,5,6
10-Oct 20:29 bareos-dir JobId 10: check full age: full is 01-Oct-2016 20:21:42,
allowed is 26-Sep-2016 20:29:46
10-Oct 20:29 bareos-dir JobId 10: Full is newer than
AlwaysIncrementalMaxFullAge -> skipping first jobid 1 because of age
10-Oct 20:29 bareos-dir JobId 10: after ConsolidateFull: jobids: 2,3,4,5,6
10-Oct 20:29 bareos-dir JobId 10: BackupClient-B: Start new consolidation
10-Oct 20:29 bareos-dir JobId 10: Using Catalog "MyCatalog"
10-Oct 20:29 bareos-dir JobId 10: Job queued. JobId=11
10-Oct 20:29 bareos-dir JobId 10: Consolidating JobId 11 started.
10-Oct 20:29 bareos-dir JobId 10: BAREOS 16.2.4 (01Jul16): 10-Oct-2016 20:29:46
JobId: 10
Job: BackupClient-C.2016-10-10_20.29.44_14
Scheduled time: 10-Oct-2016 20:29:44
Start time: 10-Oct-2016 20:29:46
End time: 10-Oct-2016 20:29:46
Termination: Consolidate OK
10-Oct 20:29 bareos-dir JobId 11: Start Virtual Backup JobId 11,
Job=BackupClient-B.2016-10-10_20.29.46_15
10-Oct 20:29 bareos-dir JobId 11: Consolidating JobIds 2,3,4,5,6
10-Oct 20:29 bareos-dir JobId 11: Bootstrap records written to
/var/lib/bareos/bareos-dir.restore.1.bsr
10-Oct 20:29 bareos-dir JobId 11: Using Device "Drive-0" to read.
10-Oct 20:29 bareos-dir JobId 11: Max configured use duration=86,400 sec.
exceeded. Marking Volume "U02301L4" as Used.
10-Oct 20:29 bareos-dir JobId 11: Using Volume "U02303L4" from 'Scratch' pool.
10-Oct 20:29 bareos-dir JobId 11: Using Device "Drive-1" to write.
10-Oct 20:29 bareos-sd JobId 11: Ready to read from volume "U02302L4" on device
"Drive-0" (/dev/tape/by-id/scsi-350223344ab000100-nst).
10-Oct 20:29 bareos-sd JobId 11: 3304 Issuing autochanger "load slot 3, drive
1" command.
10-Oct 20:29 bareos-sd JobId 11: 3305 Autochanger "load slot 3, drive 1",
status is OK.
10-Oct 20:29 bareos-sd JobId 11: Wrote label to prelabeled Volume "U02303L4" on
device "Drive-1" (/dev/tape/by-id/scsi-350223344ab000200-nst)
10-Oct 20:29 bareos-sd JobId 11: Forward spacing Volume "U02302L4" to
file:block 0:1.
10-Oct 20:29 bareos-sd JobId 11: Elapsed time=00:00:01, Transfer rate=86.44 K
Bytes/second
10-Oct 20:29 bareos-dir JobId 11: Max configured use duration=82,800 sec.
exceeded. Marking Volume "U02302L4" as Used.
10-Oct 20:29 bareos-dir JobId 11: Joblevel was set to joblevel of first
consolidated job: Incremental
10-Oct 20:29 bareos-dir JobId 11: Bareos bareos-dir 16.2.4 (01Jul16):
Build OS: x86_64-redhat-linux-gnu redhat Red Hat Enterprise
Linux Server release 6.5 (Santiago)
JobId: 11
Job: BackupClient-B.2016-10-10_20.29.46_15
Backup Level: Virtual Full
Client: "BackupClient" 16.2.4 (01Jul16)
x86_64-redhat-linux-gnu,redhat,Red Hat Enterprise Linux Server release 6.5
(Santiago),RHEL_6,x86_64
FileSet: "SelfTest" 2016-10-01 20:21:38
Pool: "AI-Consolidated" (From Job Pool's NextPool resource)
Catalog: "MyCatalog" (From Client resource)
Storage: "vtl" (From Storage from Pool's NextPool resource)
Scheduled time: 10-Oct-2016 20:29:46
Start time: 01-Oct-2016 20:22:56
End time: 01-Oct-2016 20:22:56
Elapsed time: 0 secs
Priority: 10
SD Files Written: 4
SD Bytes Written: 86,444 (86.44 KB)
Rate: 0.0 KB/s
Volume name(s): U02303L4
Volume Session Id: 10
Volume Session Time: 1475345881
Last Volume Bytes: 88,062 (88.06 KB)
SD Errors: 0
SD termination status: OK
Accurate: yes
Termination: Backup OK
10-Oct 20:29 bareos-dir JobId 11: purged JobIds 2,3,4,5,6 as they were
consolidated into Job 11
:w
*status storage=vtl
...
Device status:
Autochanger "vtl" with devices:
"Drive-0" (/dev/tape/by-id/scsi-350223344ab000100-nst)
"Drive-1" (/dev/tape/by-id/scsi-350223344ab000200-nst)
Device "Drive-1" (/dev/tape/by-id/scsi-350223344ab000200-nst) is mounted with:
Volume: U02303L4
Pool: AI-Consolidated
Media type: LTO4
Slot 3 is loaded in drive 1.
Total Bytes=88,062 Blocks=2 Bytes/block=44,031
Positioned at File=1 Block=0
==
Device "Drive-0" (/dev/tape/by-id/scsi-350223344ab000100-nst) is mounted with:
Volume: U02302L4
Pool: AI-Incremental
Media type: LTO4
Slot 2 is loaded in drive 0.
Total Bytes Read=0 Blocks Read=0 Bytes/block=0
Positioned at File=5 Block=1
...
Run several Daily always incremental jobs on 100116
*run job=BackupClient-B yes
*list jobs
+-------+----------------+--------------+---------------------+------+-------+----------+-----------+-----------+
| jobid | name | client | starttime | type | level |
jobfiles | jobbytes | jobstatus |
+-------+----------------+--------------+---------------------+------+-------+----------+-----------+-----------+
| 1 | BackupClient-B | BackupClient | 2016-10-01 20:21:40 | B | F |
136 | 7,581,933 | T |
| 11 | BackupClient-B | BackupClient | 2016-10-01 20:22:56 | B | I |
4 | 86,444 | T |
| 7 | BackupClient-B | BackupClient | 2016-10-01 20:23:00 | B | I |
3 | 51,013 | T |
| 8 | BackupClient-B | BackupClient | 2016-10-01 20:23:01 | B | I |
2 | 55,406 | T |
| 9 | BackupClient-B | BackupClient | 2016-10-01 20:23:09 | B | I |
3 | 61,069 | T |
| 10 | BackupClient-C | BackupClient | 2016-10-10 20:29:46 | O | I |
0 | 0 | T |
| 12 | BackupClient-B | BackupClient | 2016-10-10 20:33:29 | B | I |
9 | 1,294,807 | T |
| 13 | BackupClient-B | BackupClient | 2016-10-10 20:33:34 | B | I |
3 | 102,106 | T |
| 14 | BackupClient-B | BackupClient | 2016-10-10 20:33:38 | B | I |
3 | 107,224 | T |
| 15 | BackupClient-B | BackupClient | 2016-10-10 20:33:41 | B | I |
3 | 112,441 | T |
| 16 | BackupClient-B | BackupClient | 2016-10-10 20:33:42 | B | I |
2 | 115,930 | T |
| 17 | BackupClient-B | BackupClient | 2016-10-10 20:33:43 | B | I |
3 | 122,578 | T |
| 18 | BackupClient-B | BackupClient | 2016-10-10 20:33:44 | B | I |
3 | 127,697 | T |
| 19 | BackupClient-B | BackupClient | 2016-10-10 20:33:46 | B | I |
3 | 132,816 | T |
| 20 | BackupClient-B | BackupClient | 2016-10-10 20:33:47 | B | I |
3 | 137,934 | T |
+-------+----------------+--------------+---------------------+------+-------+----------+-----------+-----------+
*list volumes
Pool: AI-Incremental
+---------+------------+-----------+---------+-----------+----------+--------------+---------+------+-----------+-----------+---------------------+---------+
| mediaid | volumename | volstatus | enabled | volbytes | volfiles |
volretention | recycle | slot | inchanger | mediatype | lastwritten |
storage |
+---------+------------+-----------+---------+-----------+----------+--------------+---------+------+-----------+-----------+---------------------+---------+
| 2 | U02302L4 | Used | 1 | 392,727 | 8 |
31,536,000 | 1 | 2 | 1 | LTO4 | 2016-10-01 20:23:09 | vtl
|
| 4 | U02304L4 | Append | 1 | 2,263,602 | 9 |
31,536,000 | 1 | 4 | 1 | LTO4 | 2016-10-10 20:33:47 | vtl
|
+---------+------------+-----------+---------+-----------+----------+--------------+---------+------+-----------+-----------+---------------------+---------+
Pool: AI-Consolidated
+---------+------------+-----------+---------+-----------+----------+--------------+---------+------+-----------+-----------+---------------------+---------+
| mediaid | volumename | volstatus | enabled | volbytes | volfiles |
volretention | recycle | slot | inchanger | mediatype | lastwritten |
storage |
+---------+------------+-----------+---------+-----------+----------+--------------+---------+------+-----------+-----------+---------------------+---------+
| 1 | U02301L4 | Used | 1 | 7,606,255 | 1 |
31,536,000 | 1 | 1 | 1 | LTO4 | 2016-10-01 20:21:42 | vtl
|
| 3 | U02303L4 | Append | 1 | 88,062 | 1 |
31,536,000 | 1 | 3 | 1 | LTO4 | 2016-10-10 20:29:48 | vtl
|
+---------+------------+-----------+---------+-----------+----------+--------------+---------+------+-----------+-----------+---------------------+---------+
Pool: Scratch
+---------+------------+-----------+---------+----------+----------+--------------+---------+------+-----------+-----------+-------------+---------+
| mediaid | volumename | volstatus | enabled | volbytes | volfiles |
volretention | recycle | slot | inchanger | mediatype | lastwritten | storage |
+---------+------------+-----------+---------+----------+----------+--------------+---------+------+-----------+-----------+-------------+---------+
| 5 | U02305L4 | Append | 1 | 196 | 0 |
31,536,000 | 1 | 5 | 1 | LTO4 | | vtl |
| 6 | U02306L4 | Append | 1 | 196 | 0 |
31,536,000 | 1 | 6 | 1 | LTO4 | | vtl |
| 7 | U02307L4 | Append | 1 | 196 | 0 |
31,536,000 | 1 | 7 | 1 | LTO4 | | vtl |
| 8 | U02308L4 | Append | 1 | 196 | 0 |
31,536,000 | 1 | 8 | 1 | LTO4 | | vtl |
| 9 | U02309L4 | Append | 1 | 196 | 0 |
31,536,000 | 1 | 9 | 1 | LTO4 | | vtl |
| 10 | U02310L4 | Append | 1 | 196 | 0 |
31,536,000 | 1 | 10 | 1 | LTO4 | | vtl |
+---------+------------+-----------+---------+----------+----------+--------------+---------+------+-----------+-----------+-------------+---------+
Run consolidation job on 102016
*run job=job=BackupClient-C yes
20-Oct 20:36 bareos-dir JobId 21: Start Consolidate JobId 21,
Job=BackupClient-C.2016-10-20_20.36.57_25
20-Oct 20:36 bareos-dir JobId 21: Looking at always incremental job
BackupClient-B
20-Oct 20:36 bareos-dir JobId 21: BackupClient-B: considering jobs older than
13-Oct-2016 20:36:59 for consolidation.
20-Oct 20:36 bareos-dir JobId 21: before ConsolidateFull: jobids:
1,11,7,8,9,12,13,14,15,16,17
20-Oct 20:36 bareos-dir JobId 21: check full age: full is 01-Oct-2016 20:21:42,
allowed is 06-Oct-2016 20:36:59
20-Oct 20:36 bareos-dir JobId 21: Full is older than
AlwaysIncrementalMaxFullAge -> also consolidating Full jobid 1
20-Oct 20:36 bareos-dir JobId 21: after ConsolidateFull: jobids:
1,11,7,8,9,12,13,14,15,16,17
20-Oct 20:36 bareos-dir JobId 21: BackupClient-B: Start new consolidation
20-Oct 20:36 bareos-dir JobId 21: Using Catalog "MyCatalog"
20-Oct 20:36 bareos-dir JobId 21: Job queued. JobId=22
20-Oct 20:36 bareos-dir JobId 21: Consolidating JobId 22 started.
20-Oct 20:36 bareos-dir JobId 21: BAREOS 16.2.4 (01Jul16): 20-Oct-2016 20:36:59
JobId: 21
Job: BackupClient-C.2016-10-20_20.36.57_25
Scheduled time: 20-Oct-2016 20:36:57
Start time: 20-Oct-2016 20:36:59
End time: 20-Oct-2016 20:36:59
Termination: Consolidate OK
20-Oct 20:36 bareos-dir JobId 22: Start Virtual Backup JobId 22,
Job=BackupClient-B.2016-10-20_20.36.59_26
20-Oct 20:36 bareos-dir JobId 22: Consolidating JobIds
1,11,7,8,9,12,13,14,15,16,17
20-Oct 20:36 bareos-dir JobId 22: Bootstrap records written to
/var/lib/bareos/bareos-dir.restore.2.bsr
20-Oct 20:36 bareos-dir JobId 22: Using Device "Drive-0" to read.
20-Oct 20:36 bareos-dir JobId 22: Max configured use duration=86,400 sec.
exceeded. Marking Volume "U02303L4" as Used.
20-Oct 20:36 bareos-dir JobId 22: Using Volume "U02305L4" from 'Scratch' pool.
20-Oct 20:36 bareos-dir JobId 22: Using Device "Drive-1" to write.
20-Oct 20:36 bareos-sd JobId 22: 3307 Issuing autochanger "unload slot 4, drive
0" command.
20-Oct 20:37 bareos-sd JobId 22: 3304 Issuing autochanger "load slot 1, drive
0" command.
20-Oct 20:37 bareos-sd JobId 22: 3305 Autochanger "load slot 1, drive 0",
status is OK.
20-Oct 20:37 bareos-sd JobId 22: Ready to read from volume "U02301L4" on device
"Drive-0" (/dev/tape/by-id/scsi-350223344ab000100-nst).
20-Oct 20:37 bareos-sd JobId 22: 3307 Issuing autochanger "unload slot 3, drive
1" command.
20-Oct 20:37 bareos-sd JobId 22: 3304 Issuing autochanger "load slot 5, drive
1" command.
20-Oct 20:37 bareos-sd JobId 22: 3305 Autochanger "load slot 5, drive 1",
status is OK.
20-Oct 20:37 bareos-sd JobId 22: Wrote label to prelabeled Volume "U02305L4" on
device "Drive-1" (/dev/tape/by-id/scsi-350223344ab000200-nst)
20-Oct 20:37 bareos-sd JobId 22: Forward spacing Volume "U02301L4" to
file:block 0:1.
20-Oct 20:37 bareos-sd JobId 22: End of Volume at file 1 on device "Drive-0"
(/dev/tape/by-id/scsi-350223344ab000100-nst), Volume "U02301L4"
20-Oct 20:37 bareos-sd JobId 22: 3307 Issuing autochanger "unload slot 1, drive
0" command.
20-Oct 20:37 bareos-sd JobId 22: 3304 Issuing autochanger "load slot 4, drive
0" command.
20-Oct 20:37 bareos-sd JobId 22: 3305 Autochanger "load slot 4, drive 0",
status is OK.
20-Oct 20:37 bareos-sd JobId 22: Ready to read from volume "U02304L4" on device
"Drive-0" (/dev/tape/by-id/scsi-350223344ab000100-nst).
20-Oct 20:37 bareos-sd JobId 22: Forward spacing Volume "U02304L4" to
file:block 0:1.
20-Oct 20:37 bareos-sd JobId 22: End of Volume at file 6 on device "Drive-0"
(/dev/tape/by-id/scsi-350223344ab000100-nst), Volume "U02304L4"
20-Oct 20:37 bareos-sd JobId 22: End of all volumes.
20-Oct 20:37 bareos-sd JobId 22: Elapsed time=00:00:01, Transfer rate=7.710 M
Bytes/second
20-Oct 20:37 bareos-dir JobId 22: Max configured use duration=82,800 sec.
exceeded. Marking Volume "U02304L4" as Used.
20-Oct 20:37 bareos-dir JobId 22: Joblevel was set to joblevel of first
consolidated job: Full
20-Oct 20:37 bareos-dir JobId 22: Bareos bareos-dir 16.2.4 (01Jul16):
Build OS: x86_64-redhat-linux-gnu redhat Red Hat Enterprise
Linux Server release 6.5 (Santiago)
JobId: 22
Job: BackupClient-B.2016-10-20_20.36.59_26
Backup Level: Virtual Full
Client: "BackupClient" 16.2.4 (01Jul16)
x86_64-redhat-linux-gnu,redhat,Red Hat Enterprise Linux Server release 6.5
(Santiago),RHEL_6,x86_64
FileSet: "SelfTest" 2016-10-01 20:21:38
Pool: "AI-Consolidated" (From Job Pool's NextPool resource)
Catalog: "MyCatalog" (From Client resource)
Storage: "vtl" (From Storage from Pool's NextPool resource)
Scheduled time: 20-Oct-2016 20:36:59
Start time: 10-Oct-2016 20:33:43
End time: 10-Oct-2016 20:33:44
Elapsed time: 1 sec
Priority: 10
SD Files Written: 136
SD Bytes Written: 7,710,430 (7.710 MB)
Rate: 7710.4 KB/s
Volume name(s): U02305L4
Volume Session Id: 20
Volume Session Time: 1475345881
Last Volume Bytes: 7,721,470 (7.721 MB)
SD Errors: 0
SD termination status: OK
Accurate: yes
Termination: Backup OK
20-Oct 20:37 bareos-dir JobId 22: purged JobIds 1,11,7,8,9,12,13,14,15,16,17 as
they were consolidated into Job 22
*list jobs
+-------+----------------+--------------+---------------------+------+-------+----------+-----------+-----------+
| jobid | name | client | starttime | type | level |
jobfiles | jobbytes | jobstatus |
+-------+----------------+--------------+---------------------+------+-------+----------+-----------+-----------+
| 10 | BackupClient-C | BackupClient | 2016-10-10 20:29:46 | O | I |
0 | 0 | T |
| 22 | BackupClient-B | BackupClient | 2016-10-10 20:33:43 | B | F |
136 | 7,710,430 | T |
| 18 | BackupClient-B | BackupClient | 2016-10-10 20:33:44 | B | I |
3 | 127,697 | T |
| 19 | BackupClient-B | BackupClient | 2016-10-10 20:33:46 | B | I |
3 | 132,816 | T |
| 20 | BackupClient-B | BackupClient | 2016-10-10 20:33:47 | B | I |
3 | 137,934 | T |
| 21 | BackupClient-C | BackupClient | 2016-10-20 20:36:59 | O | I |
0 | 0 | T |
+-------+----------------+--------------+---------------------+------+-------+----------+-----------+-----------+
*list volumes
Pool: AI-Incremental
+---------+------------+-----------+---------+-----------+----------+--------------+---------+------+-----------+-----------+---------------------+---------+
| mediaid | volumename | volstatus | enabled | volbytes | volfiles |
volretention | recycle | slot | inchanger | mediatype | lastwritten |
storage |
+---------+------------+-----------+---------+-----------+----------+--------------+---------+------+-----------+-----------+---------------------+---------+
| 2 | U02302L4 | Used | 1 | 392,727 | 8 |
31,536,000 | 1 | 2 | 1 | LTO4 | 2016-10-01 20:23:09 | vtl
|
| 4 | U02304L4 | Used | 1 | 2,263,602 | 9 |
31,536,000 | 1 | 4 | 1 | LTO4 | 2016-10-10 20:33:47 | vtl
|
+---------+------------+-----------+---------+-----------+----------+--------------+---------+------+-----------+-----------+---------------------+---------+
Pool: AI-Consolidated
+---------+------------+-----------+---------+-----------+----------+--------------+---------+------+-----------+-----------+---------------------+---------+
| mediaid | volumename | volstatus | enabled | volbytes | volfiles |
volretention | recycle | slot | inchanger | mediatype | lastwritten |
storage |
+---------+------------+-----------+---------+-----------+----------+--------------+---------+------+-----------+-----------+---------------------+---------+
| 1 | U02301L4 | Used | 1 | 7,606,255 | 1 |
31,536,000 | 1 | 1 | 1 | LTO4 | 2016-10-01 20:21:42 | vtl
|
| 3 | U02303L4 | Used | 1 | 88,062 | 1 |
31,536,000 | 1 | 3 | 1 | LTO4 | 2016-10-10 20:29:48 | vtl
|
| 5 | U02305L4 | Append | 1 | 7,721,470 | 1 |
31,536,000 | 1 | 5 | 1 | LTO4 | 2016-10-20 20:37:01 | vtl
|
+---------+------------+-----------+---------+-----------+----------+--------------+---------+------+-----------+-----------+---------------------+---------+
Pool: Scratch
+---------+------------+-----------+---------+----------+----------+--------------+---------+------+-----------+-----------+-------------+---------+
| mediaid | volumename | volstatus | enabled | volbytes | volfiles |
volretention | recycle | slot | inchanger | mediatype | lastwritten | storage |
+---------+------------+-----------+---------+----------+----------+--------------+---------+------+-----------+-----------+-------------+---------+
| 6 | U02306L4 | Append | 1 | 196 | 0 |
31,536,000 | 1 | 6 | 1 | LTO4 | | vtl |
| 7 | U02307L4 | Append | 1 | 196 | 0 |
31,536,000 | 1 | 7 | 1 | LTO4 | | vtl |
| 8 | U02308L4 | Append | 1 | 196 | 0 |
31,536,000 | 1 | 8 | 1 | LTO4 | | vtl |
| 9 | U02309L4 | Append | 1 | 196 | 0 |
31,536,000 | 1 | 9 | 1 | LTO4 | | vtl |
| 10 | U02310L4 | Append | 1 | 196 | 0 |
31,536,000 | 1 | 10 | 1 | LTO4 | | vtl |
+---------+------------+-----------+---------+----------+----------+--------------+---------+------+-----------+-----------+-------------+---------+
*status storage=vtl
...
Device status:
Autochanger "vtl" with devices:
"Drive-0" (/dev/tape/by-id/scsi-350223344ab000100-nst)
"Drive-1" (/dev/tape/by-id/scsi-350223344ab000200-nst)
Device "Drive-1" (/dev/tape/by-id/scsi-350223344ab000200-nst) is mounted with:
Volume: U02305L4
Pool: AI-Consolidated
Media type: LTO4
Slot 5 is loaded in drive 1.
Total Bytes=7,721,470 Blocks=120 Bytes/block=64,345
Positioned at File=1 Block=0
==
Device "Drive-0" (/dev/tape/by-id/scsi-350223344ab000100-nst) is mounted with:
Volume: U02304L4
Pool: AI-Incremental
Media type: LTO4
Slot 4 is loaded in drive 0.
Total Bytes Read=0 Blocks Read=0 Bytes/block=0
Positioned at File=6 Block=1
Run several Daily always incremental jobs on 102016
*run job=BackupClient-B yes
*list jobs
+-------+----------------+--------------+---------------------+------+-------+----------+-----------+-----------+
| jobid | name | client | starttime | type | level |
jobfiles | jobbytes | jobstatus |
+-------+----------------+--------------+---------------------+------+-------+----------+-----------+-----------+
| 10 | BackupClient-C | BackupClient | 2016-10-10 20:29:46 | O | I |
0 | 0 | T |
| 22 | BackupClient-B | BackupClient | 2016-10-10 20:33:43 | B | F |
136 | 7,710,430 | T |
| 18 | BackupClient-B | BackupClient | 2016-10-10 20:33:44 | B | I |
3 | 127,697 | T |
| 19 | BackupClient-B | BackupClient | 2016-10-10 20:33:46 | B | I |
3 | 132,816 | T |
| 20 | BackupClient-B | BackupClient | 2016-10-10 20:33:47 | B | I |
3 | 137,934 | T |
| 21 | BackupClient-C | BackupClient | 2016-10-20 20:36:59 | O | I |
0 | 0 | T |
| 23 | BackupClient-B | BackupClient | 2016-10-20 20:42:04 | B | I |
9 | 1,440,129 | T |
| 24 | BackupClient-B | BackupClient | 2016-10-20 20:42:11 | B | I |
3 | 195,596 | T |
| 25 | BackupClient-B | BackupClient | 2016-10-20 20:42:15 | B | I |
3 | 200,714 | T |
| 26 | BackupClient-B | BackupClient | 2016-10-20 20:42:20 | B | I |
3 | 205,832 | T |
| 27 | BackupClient-B | BackupClient | 2016-10-20 20:42:24 | B | I |
3 | 210,950 | T |
| 28 | BackupClient-B | BackupClient | 2016-10-20 20:42:28 | B | I |
3 | 216,068 | T |
| 29 | BackupClient-B | BackupClient | 2016-10-20 20:42:32 | B | I |
3 | 221,186 | T |
| 30 | BackupClient-B | BackupClient | 2016-10-20 20:42:56 | B | I |
3 | 226,386 | T |
+-------+----------------+--------------+---------------------+------+-------+----------+-----------+-----------+
*list volumes
Pool: AI-Consolidated
+---------+------------+-----------+---------+-----------+----------+--------------+---------+------+-----------+-----------+---------------------+---------+
| mediaid | volumename | volstatus | enabled | volbytes | volfiles |
volretention | recycle | slot | inchanger | mediatype | lastwritten |
storage |
+---------+------------+-----------+---------+-----------+----------+--------------+---------+------+-----------+-----------+---------------------+---------+
| 1 | U02301L4 | Used | 1 | 7,606,255 | 1 |
31,536,000 | 1 | 1 | 1 | LTO4 | 2016-10-01 20:21:42 | vtl
|
| 3 | U02303L4 | Used | 1 | 88,062 | 1 |
31,536,000 | 1 | 3 | 1 | LTO4 | 2016-10-10 20:29:48 | vtl
|
| 5 | U02305L4 | Append | 1 | 7,721,470 | 1 |
31,536,000 | 1 | 5 | 1 | LTO4 | 2016-10-20 20:37:01 | vtl
|
+---------+------------+-----------+---------+-----------+----------+--------------+---------+------+-----------+-----------+---------------------+---------+
Pool: Scratch
+---------+------------+-----------+---------+----------+----------+--------------+---------+------+-----------+-----------+-------------+---------+
| mediaid | volumename | volstatus | enabled | volbytes | volfiles |
volretention | recycle | slot | inchanger | mediatype | lastwritten | storage |
+---------+------------+-----------+---------+----------+----------+--------------+---------+------+-----------+-----------+-------------+---------+
| 7 | U02307L4 | Append | 1 | 196 | 0 |
31,536,000 | 1 | 7 | 1 | LTO4 | | vtl |
| 8 | U02308L4 | Append | 1 | 196 | 0 |
31,536,000 | 1 | 8 | 1 | LTO4 | | vtl |
| 9 | U02309L4 | Append | 1 | 196 | 0 |
31,536,000 | 1 | 9 | 1 | LTO4 | | vtl |
| 10 | U02310L4 | Append | 1 | 196 | 0 |
31,536,000 | 1 | 10 | 1 | LTO4 | | vtl |
+---------+------------+-----------+---------+----------+----------+--------------+---------+------+-----------+-----------+-------------+---------+
Pool: AI-Incremental
+---------+------------+-----------+---------+-----------+----------+--------------+---------+------+-----------+-----------+---------------------+---------+
| mediaid | volumename | volstatus | enabled | volbytes | volfiles |
volretention | recycle | slot | inchanger | mediatype | lastwritten |
storage |
+---------+------------+-----------+---------+-----------+----------+--------------+---------+------+-----------+-----------+---------------------+---------+
| 2 | U02302L4 | Used | 1 | 392,727 | 8 |
31,536,000 | 1 | 2 | 1 | LTO4 | 2016-10-01 20:23:09 | vtl
|
| 4 | U02304L4 | Used | 1 | 2,263,602 | 9 |
31,536,000 | 1 | 4 | 1 | LTO4 | 2016-10-10 20:33:47 | vtl
|
| 6 | U02306L4 | Append | 1 | 2,926,773 | 8 |
31,536,000 | 1 | 6 | 1 | LTO4 | 2016-10-20 20:42:56 | vtl
|
+---------+------------+-----------+---------+-----------+----------+--------------+---------+------+-----------+-----------+---------------------+---------+
*status storage=vtl
...
Device status:
Autochanger "vtl" with devices:
"Drive-0" (/dev/tape/by-id/scsi-350223344ab000100-nst)
"Drive-1" (/dev/tape/by-id/scsi-350223344ab000200-nst)
Device "Drive-1" (/dev/tape/by-id/scsi-350223344ab000200-nst) is mounted with:
Volume: U02305L4
Pool: AI-Consolidated
Media type: LTO4
Slot 5 is loaded in drive 1.
Total Bytes=7,721,470 Blocks=120 Bytes/block=64,345
Positioned at File=1 Block=0
==
Device "Drive-0" (/dev/tape/by-id/scsi-350223344ab000100-nst) is mounted with:
Volume: U02306L4
Pool: AI-Incremental
Media type: LTO4
Slot 6 is loaded in drive 0.
Total Bytes=2,926,773 Blocks=51 Bytes/block=57,387
Positioned at File=8 Block=0
Run consolidation job on 103016
*run job=job=BackupClient-C yes
30-Oct 19:51 bareos-dir JobId 36: Start Consolidate JobId 36,
Job=BackupClient-C.2016-10-30_19.51.07_40
30-Oct 19:51 bareos-dir JobId 36: Looking at always incremental job
BackupClient-B
30-Oct 19:51 bareos-dir JobId 36: BackupClient-B: considering jobs older than
23-Oct-2016 20:51:09 for consolidation.
30-Oct 19:51 bareos-dir JobId 36: before ConsolidateFull: jobids:
22,32,23,24,25,26,27,28,29
30-Oct 19:51 bareos-dir JobId 36: check full age: full is 10-Oct-2016 20:33:44,
allowed is 16-Oct-2016 20:51:09
30-Oct 19:51 bareos-dir JobId 36: Full is older than
AlwaysIncrementalMaxFullAge -> also consolidating Full jobid 22
30-Oct 19:51 bareos-dir JobId 36: after ConsolidateFull: jobids:
22,32,23,24,25,26,27,28,29
30-Oct 19:51 bareos-dir JobId 36: BackupClient-B: Start new consolidation
30-Oct 19:51 bareos-dir JobId 36: Using Catalog "MyCatalog"
30-Oct 19:51 bareos-dir JobId 36: Job queued. JobId=37
30-Oct 19:51 bareos-dir JobId 36: Consolidating JobId 37 started.
30-Oct 19:51 bareos-dir JobId 36: BAREOS 16.2.4 (01Jul16): 30-Oct-2016 19:51:09
JobId: 36
Job: BackupClient-C.2016-10-30_19.51.07_40
Scheduled time: 30-Oct-2016 19:51:07
Start time: 30-Oct-2016 19:51:09
End time: 30-Oct-2016 19:51:09
Termination: Consolidate OK
30-Oct 19:51 bareos-dir JobId 37: Start Virtual Backup JobId 37,
Job=BackupClient-B.2016-10-30_19.51.09_41
30-Oct 19:51 bareos-dir JobId 37: Consolidating JobIds
22,32,23,24,25,26,27,28,29
30-Oct 19:51 bareos-dir JobId 37: Bootstrap records written to
/var/lib/bareos/bareos-dir.restore.4.bsr
30-Oct 19:51 bareos-dir JobId 37: Using Device "Drive-0" to read.
30-Oct 19:51 bareos-dir JobId 37: Max configured use duration=86,400 sec.
exceeded. Marking Volume "U02305L4" as Used.
30-Oct 19:51 bareos-dir JobId 37: Using Volume "U02307L4" from 'Scratch' pool.
30-Oct 19:51 bareos-dir JobId 37: Using Device "Drive-1" to write.
30-Oct 19:51 bareos-sd JobId 37: 3307 Issuing autochanger "unload slot 6, drive
0" command.
*status storage=vtl
...
Device status:
Autochanger "vtl" with devices:
"Drive-0" (/dev/tape/by-id/scsi-350223344ab000100-nst)
"Drive-1" (/dev/tape/by-id/scsi-350223344ab000200-nst)
Device "Drive-1" (/dev/tape/by-id/scsi-350223344ab000200-nst) is mounted with:
Volume: U02305L4
Pool: AI-Consolidated
Media type: LTO4
Slot 5 is loaded in drive 1.
Total Bytes=7,860,355 Blocks=123 Bytes/block=63,905
Positioned at File=2 Block=0
==
Device "Drive-0" (/dev/tape/by-id/scsi-350223344ab000100-nst) is not open.
Device is being initialized.
Drive 0 is not loaded.
### Further message output from Consolidation-Job
...
30-Oct 19:54 bareos-sd JobId 37: Warning: Volume "U02305L4" wanted on "Drive-0"
(/dev/tape/by-id/scsi-350223344ab000100-nst) is in use by device "Drive-1"
(/dev/tape/by-id/scsi-350223344ab000200-nst)
30-Oct 19:54 bareos-sd JobId 37: Warning: acquire.c:239 Read open device
"Drive-0" (/dev/tape/by-id/scsi-350223344ab000100-nst) Volume "U02305L4"
failed: ERR=generic_tape_device.c:140 Unable to open device "Drive-0"
(/dev/tape/by-id/scsi-350223344ab000100-nst): ERR=No medium found
30-Oct 19:57 bareos-sd JobId 37: Warning: Volume "U02305L4" wanted on "Drive-0"
(/dev/tape/by-id/scsi-350223344ab000100-nst) is in use by device "Drive-1"
(/dev/tape/by-id/scsi-350223344ab000200-nst)
30-Oct 19:57 bareos-sd JobId 37: Please mount read Volume "U02305L4" for:
Job: BackupClient-B.2016-10-30_19.51.09_41
Storage: "Drive-0" (/dev/tape/by-id/scsi-350223344ab000100-nst)
Pool: AI-Incremental
Media type: LTO4
*list volumes
Pool: AI-Consolidated
+---------+------------+-----------+---------+-----------+----------+--------------+---------+------+-----------+-----------+---------------------+---------+
| mediaid | volumename | volstatus | enabled | volbytes | volfiles |
volretention | recycle | slot | inchanger | mediatype | lastwritten |
storage |
+---------+------------+-----------+---------+-----------+----------+--------------+---------+------+-----------+-----------+---------------------+---------+
| 1 | U02301L4 | Used | 1 | 7,606,255 | 1 |
31,536,000 | 1 | 1 | 1 | LTO4 | 2016-10-01 20:21:42 | vtl
|
| 3 | U02303L4 | Used | 1 | 88,062 | 1 |
31,536,000 | 1 | 3 | 1 | LTO4 | 2016-10-10 20:29:48 | vtl
|
| 5 | U02305L4 | Used | 1 | 7,860,355 | 2 |
31,536,000 | 1 | 5 | 1 | LTO4 | 2016-10-20 20:45:39 | vtl
|
| 7 | U02307L4 | Append | 1 | 196 | 0 |
31,536,000 | 1 | 7 | 1 | LTO4 | | vtl
|
+---------+------------+-----------+---------+-----------+----------+--------------+---------+------+-----------+-----------+---------------------+---------+
Pool: AI-Incremental
+---------+------------+-----------+---------+-----------+----------+--------------+---------+------+-----------+-----------+---------------------+---------+
| mediaid | volumename | volstatus | enabled | volbytes | volfiles |
volretention | recycle | slot | inchanger | mediatype | lastwritten |
storage |
+---------+------------+-----------+---------+-----------+----------+--------------+---------+------+-----------+-----------+---------------------+---------+
| 2 | U02302L4 | Used | 1 | 392,727 | 8 |
31,536,000 | 1 | 2 | 1 | LTO4 | 2016-10-01 20:23:09 | vtl
|
| 4 | U02304L4 | Used | 1 | 2,263,602 | 9 |
31,536,000 | 1 | 4 | 1 | LTO4 | 2016-10-10 20:33:47 | vtl
|
| 6 | U02306L4 | Append | 1 | 4,709,964 | 10 |
31,536,000 | 1 | 6 | 1 | LTO4 | 2016-10-20 20:50:27 | vtl
|
+---------+------------+-----------+---------+-----------+----------+--------------+---------+------+-----------+-----------+---------------------+---------+
Pool: Scratch
+---------+------------+-----------+---------+----------+----------+--------------+---------+------+-----------+-----------+-------------+---------+
| mediaid | volumename | volstatus | enabled | volbytes | volfiles |
volretention | recycle | slot | inchanger | mediatype | lastwritten | storage |
+---------+------------+-----------+---------+----------+----------+--------------+---------+------+-----------+-----------+-------------+---------+
| 8 | U02308L4 | Append | 1 | 196 | 0 |
31,536,000 | 1 | 8 | 1 | LTO4 | | vtl |
| 9 | U02309L4 | Append | 1 | 196 | 0 |
31,536,000 | 1 | 9 | 1 | LTO4 | | vtl |
| 10 | U02310L4 | Append | 1 | 196 | 0 |
31,536,000 | 1 | 10 | 1 | LTO4 | | vtl |
+---------+------------+-----------+---------+----------+----------+--------------+---------+------+-----------+-----------+-------------+---------+
--
You received this message because you are subscribed to the Google Groups
"bareos-users" group.
To unsubscribe from this group and stop receiving emails from it, send an email
to [email protected].
To post to this group, send email to [email protected].
For more options, visit https://groups.google.com/d/optout.