Open but no Bareos volume is currently mounted, Please help !

[A M]

Hi everyone, I’ve been using Bareos for almost two years. In general, everything suits, about 60 hosts are reserved. For storage, the IBM TS3310 tape library with 8 LTO-6 drives is used. The system can work without failures for a long time, but from time to time there is a problem with damage to labels on tapes, and as a rule several tapes deteriorate on the same day, which are in different pools. The system is used in an industrial environment, this problem is critical since archive data is corrupted.

If a problem occurs, SD mounts the tape but cannot read the label and hangs waiting to mount the desired tape.

Version Bareos-dir 17.2.7, Centos 7.

Bareos-fd version 17.2.4-17.2.7, linux, unix, windows

---------------------

Device "tape1" (/dev/tape/by-id/scsi-3500308c3a1b6f090-nst) open but no Bareos volume is currently mounted.

    Device is BLOCKED waiting for mount of volume "ABC099L6",

       Pool:        Catalog

       Media type:  LTO-6

    Slot 113 is loaded in drive 1.

    Total Bytes Read=62,914,560 Blocks Read=60 Bytes/block=1,048,576

    Positioned at File=0 Block=0

---------------------

ABC099L6 on device "tape1" (/dev/tape/by-id/scsi-3500308c3a1b6f090-nst)

    Reader=0 writers=0 reserves=1 volinuse=0

--------------------

31000 OK: bareos-msk Version: 17.2.7 (16 Jul 2018)

Enter a period to cancel a command.

*mount

Automatically selected Catalog: MyCatalog

Using Catalog "MyCatalog"

The defined Storage resources are:

     1: VTL_EMC

     2: TS3310

     3: TS3310AES

     4: File

Select Storage resource (1-4): 2

Select Drive:

     1: Drive 0

     2: Drive 1

     3: Drive 2

     4: Drive 3

     5: Drive 4

     6: Drive 5

Select drive (1-6): 2

Enter autochanger slot: 113

Connecting to Storage daemon TS3310 at as-bareos-msk.orient.root.biz:9103 ...

3304 Issuing autochanger "load slot 113, drive 1" command.

3305 Autochanger "load slot 113, drive 1", status is OK.

3902 Cannot mount Volume on Storage Device ""tape1" (/dev/tape/by-id/scsi-3500308c3a1b6f090-nst)" because:

Could not unserialize Volume label: ERR=label.c:872 Expecting Volume Label, got FI=SOS_LABEL Stream=8624 len=160

3905 Device "tape1" (/dev/tape/by-id/scsi-3500308c3a1b6f090-nst) open but no Bareos volume is mounted.

If this is not a blank tape, try unmounting and remounting the Volume.

--------------------

[Andreas Rogge]

> Could not unserialize Volume label: ERR=label.c:872 Expecting Volume
> Label, got FI=SOS_LABEL Stream=8624 len=160
>

This message is really bad.
Bareos loads your tape to the drive and tries to read its volume label.
While doing so it doesn't find a VOL_LABEL or PRE_LABEL, but a SOS_LABEL.
The SOS_LABEL is a start of session (i.e. begin of backup stream) label.
This must not be at the start of your tapes. The only thing I can
imagine how that happens it that somebody/something rewound your tapes
without Bareos noticing it.
Are you using the nst-device (no-auto-rewind) for each of your drives?
If any other software or an operator accessing the library or drives?

Best Regards,
Andreas
--
Andreas Rogge andrea...@bareos.com
Bareos GmbH & Co. KG Phone: +49 221-630693-86
http://www.bareos.com

Sitz der Gesellschaft: Köln | Amtsgericht Köln: HRA 29646
Komplementär: Bareos Verwaltungs-GmbH
Geschäftsführer: S. Dühr, M. Außendorf, J. Steffens, Philipp Storz

[A M]

Thanks for the quick answer, yes nst are used, for example:

ArchiveDevice = / dev / tape / by-id / scsi-3500308c3a1b6f094-nst

other programs do not have access to the library.

среда, 2 октября 2019 г., 16:30:39 UTC+10 пользователь Andreas Rogge написал:

[A M]

Btape:

*readlabel

btape (100): dev.c:506-0 setting minblocksize to 1048576, maxblocksize to label_block_size=1048576, on device "tape2" (/dev/tape/by-id/scsi-3500308c3a1b6f094-nst)

btape (100): label.c:78-0 Enter read_volume_label res=0 device="tape2" (/dev/tape/by-id/scsi-3500308c3a1b6f094-nst) vol= dev_Vol=*NULL* max_blocksize=1048576

btape (400): generic_tape_device.c:1117-0 rewind res=0 fd=3 "tape2" (/dev/tape/by-id/scsi-3500308c3a1b6f094-nst)

btape (250): sd_plugins.c:342-0 sd-plugin_ctx_list=aadb78 JobId=0

btape (250): sd_plugins.c:256-0 Event 8 disabled for this plugin.

btape (250): sd_plugins.c:256-0 Event 8 disabled for this plugin.

btape (130): label.c:142-0 Big if statement in read_volume_label

btape (250): block.c:963-0 Full read in read_block_from_device() len=1048576

btape (250): block.c:1018-0 Read device got 1048576 bytes at 0:0

btape (390): block.c:313-0 unser_block_header block_len=1048576

btape (390): block.c:326-0 Read binbuf = 1048552 24 block_len=1048576

btape (250): block.c:1164-0 At end of read block

btape (250): block.c:1178-0 Exit read_block read_len=1048576 block_len=1048576

btape (130): label.c:154-0 Could not unserialize Volume label: ERR=label.c:872 Expecting Volume Label, got FI=SOS_LABEL Stream=8624 len=160

btape (100): label.c:175-0 No volume label - bailing out

btape (400): generic_tape_device.c:1117-0 rewind res=0 fd=3 "tape2" (/dev/tape/by-id/scsi-3500308c3a1b6f094-nst)

btape (150): label.c:289-0 return 3

btape: btape.c:533-0 Volume has no label.

Volume Label:

Id                : **error**VerNo             : 0

VolName           :

PrevVolName       :

VolFile           : 0

LabelType         : Unknown 0

LabelSize         : 0

PoolName          :

MediaType         :

PoolType          :

HostName          :

Date label written: -4712-01-01 at 00:00

-------------------------------------

среда, 2 октября 2019 г., 16:57:47 UTC+10 пользователь A M написал: