Google Groups no longer supports new Usenet posts or subscriptions. Historical content remains viewable.
Dismiss

Bug#784675: gvfs-udisks2-volume-monitor segfaults while mounting

31 views
Skip to first unread message

Julian

unread,
May 7, 2015, 1:40:04 PM5/7/15
to
Package: gvfs
Version: 1.22.2-1
Severity: normal

Hi,

I already read that there seems to be a bug related to unmounting a file system
that crashes gvfs-udisks2-volume-monitor. But my experience didn't happen while
unmounting so I guess it's something different ;) Unfortunately I haven't gvfs-
dbg installed.

I'm having an external usb disk connected with 2 partitions that should be
mounted: One FAT called "BOOT" and ohne luks/dm-crypt partition using ext4
called "Chiligreen".

First, after resuming from standby my syslog contains the following error
messages (they're repeated a few times) but I didn't notice:

May 7 17:00:21 notebookneu udisksd[1467]: Cleaning up LUKS device /dev/dm-0
(backing device 8:17 no longer exist)
May 7 17:00:26 notebookneu udisksd[1467]: Error cleaning up LUKS device
/dev/dm-0: Command-line `cryptsetup luksClose "/dev/dm-0"' exited with non-zero
exit status 5:
device-mapper: remove ioctl on luks-085d01f6-edcb-4b47-bb70-bea27fce1755
failed: Das Gerät oder die Ressource ist belegt#012device-mapper: remove ioctl
on luks-085d01
f6-edcb-4b47-bb70-bea27fce1755 failed: Das Gerät oder die Ressource ist belegt
#012device-mapper: remove ioctl on luks-085d01f6-edcb-4b47-bb70-bea27fce1755
failed: Das
Gerät oder die Ressource ist belegt#012device-mapper: remove ioctl on luks-
085d01f6-edcb-4b47-bb70-bea27fce1755 failed: Das Gerät oder die Ressource ist
belegt
[...repeated several times...]
#012device-mapper: remove ioctl on luks-085d01f6-edcb-4b47-bb70-bea27fce1755
failed: Das Gerät oder die Ressource ist belegt#012Gerät »/dev/dm-0« wird
gerade benutzt.

I then unknowingly played some music with banshee until it tried to access a
file on the luks/dm-crypt partition. Banshee crashed without trace in the log
file and syslog contains:

May 7 18:21:43 notebookneu kernel: [93113.387800] usb 3-1: new full-speed USB
device number 18 using ohci-pci
May 7 18:21:43 notebookneu kernel: [93113.554821] usb 3-1: New USB device
found, idVendor=0d8c, idProduct=013c
May 7 18:21:43 notebookneu kernel: [93113.554837] usb 3-1: New USB device
strings: Mfr=1, Product=2, SerialNumber=0
May 7 18:21:43 notebookneu kernel: [93113.554847] usb 3-1: Product: USB PnP
Sound Device
May 7 18:21:43 notebookneu kernel: [93113.727173] input: USB PnP Sound Device
as
/devices/pci0000:00/0000:00:12.0/usb3/3-1/3-1:1.3/0003:0D8C:013C.000E/input/input27
May 7 18:21:43 notebookneu kernel: [93113.728034] hid-generic
0003:0D8C:013C.000E: input,hidraw0: USB HID v1.00 Device [USB PnP Sound Device]
on usb-0000:00:12.0-1/input3
May 7 18:21:45 notebookneu mtp-probe: checking bus 3, device 18:
"/sys/devices/pci0000:00/0000:00:12.0/usb3/3-1"
May 7 18:21:45 notebookneu mtp-probe: bus: 3, device: 18 was not an MTP device
May 7 18:21:54 notebookneu pulseaudio[2230]: [alsa-source-ALC270 Analog]
asyncq.c: q overrun, queuing locally
May 7 18:21:54 notebookneu pulseaudio[2230]: [alsa-source-ALC270 Analog]
asyncq.c: q overrun, queuing locally
May 7 18:21:54 notebookneu pulseaudio[2230]: [alsa-source-ALC270 Analog]
asyncq.c: q overrun, queuing locally
May 7 18:21:55 notebookneu pulseaudio[2230]: [alsa-source-ALC270 Analog]
asyncq.c: q overrun, queuing locally
May 7 18:21:55 notebookneu pulseaudio[2230]: [alsa-source-ALC270 Analog]
asyncq.c: q overrun, queuing locally
May 7 18:21:55 notebookneu pulseaudio[2230]: [alsa-source-ALC270 Analog]
asyncq.c: q overrun, queuing locally
May 7 18:21:55 notebookneu pulseaudio[2230]: [alsa-source-ALC270 Analog]
asyncq.c: q overrun, queuing locally
May 7 18:21:55 notebookneu pulseaudio[2230]: [alsa-source-ALC270 Analog]
asyncq.c: q overrun, queuing locally
May 7 18:21:55 notebookneu pulseaudio[2230]: [alsa-source-ALC270 Analog]
asyncq.c: q overrun, queuing locally
May 7 18:21:56 notebookneu rtkit-daemon[1362]: Supervising 0 threads of 0
processes of 0 users.
May 7 18:21:56 notebookneu rtkit-daemon[1362]: Successfully made thread 29182
of process 2230 (/usr/bin/pulseaudio) owned by '1000' RT at priority 5.
May 7 18:21:56 notebookneu rtkit-daemon[1362]: Supervising 1 threads of 1
processes of 1 users.
May 7 18:21:56 notebookneu rtkit-daemon[1362]: Supervising 1 threads of 1
processes of 1 users.
May 7 18:21:56 notebookneu rtkit-daemon[1362]: Successfully made thread 29183
of process 2230 (/usr/bin/pulseaudio) owned by '1000' RT at priority 5.
May 7 18:21:56 notebookneu rtkit-daemon[1362]: Supervising 2 threads of 1
processes of 1 users.
May 7 18:25:01 notebookneu kernel: [93311.280370] Buffer I/O error on device
dm-0, logical block 182484992
May 7 18:25:01 notebookneu kernel: [93311.280381] lost page write due to I/O
error on dm-0
May 7 18:25:01 notebookneu kernel: [93311.280392] JBD2: Error -5 detected when
updating journal superblock for dm-0-8.
May 7 18:25:01 notebookneu kernel: [93311.289620] Buffer I/O error on device
dm-0, logical block 0
May 7 18:25:01 notebookneu kernel: [93311.289632] lost page write due to I/O
error on dm-0

I then unplugged the device and plugged it in again. "BOOT" was recognized and
mounted. The filemanager Caja opened the partition and I got asked for the
passphrase for the LUKS partition (usually this shouldn't need to be entered
anymore. Also the name of the partition wasn't shown). After entering the pass
phrase caja closed and "BOOT" vanished:


May 7 18:31:10 notebookneu kernel: [93680.678256] usb 1-3: USB disconnect,
device number 24
May 7 18:31:14 notebookneu kernel: [93684.056377] usb 1-3: new high-speed USB
device number 26 using ehci-pci
May 7 18:31:14 notebookneu kernel: [93684.347081] usb 1-3: New USB device
found, idVendor=174c, idProduct=5106
May 7 18:31:14 notebookneu kernel: [93684.347099] usb 1-3: New USB device
strings: Mfr=2, Product=3, SerialNumber=1
May 7 18:31:14 notebookneu kernel: [93684.347108] usb 1-3: Product: AS2105
May 7 18:31:14 notebookneu kernel: [93684.347116] usb 1-3: Manufacturer:
ASMedia
May 7 18:31:14 notebookneu kernel: [93684.347124] usb 1-3: SerialNumber:
Z1E0VMWQ
May 7 18:31:14 notebookneu kernel: [93684.348743] usb-storage 1-3:1.0: USB
Mass Storage device detected
May 7 18:31:14 notebookneu kernel: [93684.350849] scsi5 : usb-storage 1-3:1.0
May 7 18:31:14 notebookneu mtp-probe: checking bus 1, device 26:
"/sys/devices/pci0000:00/0000:00:12.2/usb1/1-3"
May 7 18:31:14 notebookneu mtp-probe: bus: 1, device: 26 was not an MTP device
May 7 18:31:15 notebookneu kernel: [93685.349766] scsi 5:0:0:0: Direct-Access
ST1500DM 003-9YN16G CC4C PQ: 0 ANSI: 0
May 7 18:31:15 notebookneu kernel: [93685.351337] sd 5:0:0:0: Attached scsi
generic sg2 type 0
May 7 18:31:15 notebookneu kernel: [93685.355029] sd 5:0:0:0: [sdc] 2930277168
512-byte logical blocks: (1.50 TB/1.36 TiB)
May 7 18:31:15 notebookneu kernel: [93685.356092] sd 5:0:0:0: [sdc] Write
Protect is off
May 7 18:31:15 notebookneu kernel: [93685.356107] sd 5:0:0:0: [sdc] Mode
Sense: 23 00 00 00
May 7 18:31:15 notebookneu kernel: [93685.358446] sd 5:0:0:0: [sdc] No Caching
mode page found
May 7 18:31:15 notebookneu kernel: [93685.358464] sd 5:0:0:0: [sdc] Assuming
drive cache: write through
May 7 18:31:21 notebookneu kernel: [93691.553856] sdc: sdc1 sdc2 sdc3
May 7 18:31:21 notebookneu kernel: [93691.560817] sd 5:0:0:0: [sdc] Attached
SCSI disk
May 7 18:31:23 notebookneu kernel: [93693.835777] FAT-fs (sdc2): utf8 is not a
recommended IO charset for FAT filesystems, filesystem will be case sensitive!
May 7 18:31:23 notebookneu kernel: [93693.847972] FAT-fs (sdc2): Volume was
not properly unmounted. Some data may be corrupt. Please run fsck.
May 7 18:31:24 notebookneu udisksd[1467]: Mounted /dev/sdc2 at
/media/styxxx/BOOT on behalf of uid 1000
May 7 18:31:24 notebookneu org.gtk.Private.UDisks2VolumeMonitor[2197]:
index_parse.c:190: indx_parse(): error opening
/media/styxxx/BOOT/BDMV/index.bdmv
May 7 18:31:24 notebookneu org.gtk.Private.UDisks2VolumeMonitor[2197]:
index_parse.c:190: indx_parse(): error opening
/media/styxxx/BOOT/BDMV/BACKUP/index.bdmv
May 7 18:31:38 notebookneu kernel: [93708.824387] gvfs-udisks2-vo[2312]:
segfault at 8 ip 000000000040fe90 sp 00007ffde23cf1f0 error 4 in gvfs-udisks2
-volume-monitor[400000+25000]


I then again unplugged the device a few times, but it wasn't mounted anymore:


May 7 18:33:43 notebookneu kernel: [93833.468130] usb 1-3: USB disconnect,
device number 26
May 7 18:33:43 notebookneu udisksd[1467]: Cleaning up mount point
/media/styxxx/BOOT (device 8:34 no longer exist)
May 7 18:33:44 notebookneu udisksd[1467]: Cleaning up LUKS device /dev/dm-0
(backing device 8:17 no longer exist)
May 7 18:33:46 notebookneu kernel: [93836.507531] usb 1-3: new high-speed USB
device number 27 using ehci-pci
May 7 18:33:46 notebookneu kernel: [93836.673651] usb 1-3: New USB device
found, idVendor=174c, idProduct=5106
May 7 18:33:46 notebookneu kernel: [93836.673668] usb 1-3: New USB device
strings: Mfr=2, Product=3, SerialNumber=1
May 7 18:33:46 notebookneu kernel: [93836.673677] usb 1-3: Product: AS2105
May 7 18:33:46 notebookneu kernel: [93836.673685] usb 1-3: Manufacturer:
ASMedia
May 7 18:33:46 notebookneu kernel: [93836.673693] usb 1-3: SerialNumber:
Z1E0VMWQ
May 7 18:33:46 notebookneu kernel: [93836.675198] usb-storage 1-3:1.0: USB
Mass Storage device detected
May 7 18:33:46 notebookneu kernel: [93836.676199] scsi6 : usb-storage 1-3:1.0
May 7 18:33:47 notebookneu mtp-probe: checking bus 1, device 27:
"/sys/devices/pci0000:00/0000:00:12.2/usb1/1-3"
May 7 18:33:47 notebookneu mtp-probe: bus: 1, device: 27 was not an MTP device
May 7 18:33:47 notebookneu kernel: [93837.677896] scsi 6:0:0:0: Direct-Access
ST1500DM 003-9YN16G CC4C PQ: 0 ANSI: 0
May 7 18:33:47 notebookneu kernel: [93837.682562] sd 6:0:0:0: Attached scsi
generic sg2 type 0
May 7 18:33:47 notebookneu kernel: [93837.683413] sd 6:0:0:0: [sdb] 2930277168
512-byte logical blocks: (1.50 TB/1.36 TiB)
May 7 18:33:47 notebookneu kernel: [93837.684812] sd 6:0:0:0: [sdb] Write
Protect is off
May 7 18:33:47 notebookneu kernel: [93837.684832] sd 6:0:0:0: [sdb] Mode
Sense: 23 00 00 00
May 7 18:33:47 notebookneu kernel: [93837.689434] sd 6:0:0:0: [sdb] No Caching
mode page found
May 7 18:33:47 notebookneu kernel: [93837.689455] sd 6:0:0:0: [sdb] Assuming
drive cache: write through
May 7 18:33:52 notebookneu kernel: [93842.455425] sdb: sdb1 sdb2 sdb3
May 7 18:33:52 notebookneu kernel: [93842.463107] sd 6:0:0:0: [sdb] Attached
SCSI disk


Then I executed "gvfs-mount -l":

$ gvfs-mount -l
Drive(0): SAMSUNG HM321HI
Type: GProxyDrive (GProxyVolumeMonitorUDisks2)
Volume(0): Datenträger 27 GB
Type: GProxyVolume (GProxyVolumeMonitorUDisks2)
Drive(1): hp DVDRAM GT50N
Type: GProxyDrive (GProxyVolumeMonitorUDisks2)
Drive(2): ST1500DM003-9YN16G
Type: GProxyDrive (GProxyVolumeMonitorUDisks2)
Volume(0): BOOT
Type: GProxyVolume (GProxyVolumeMonitorUDisks2)
Volume(1): 1,5 TB verschlüsselt
Type: GProxyVolume (GProxyVolumeMonitorUDisks2)


and suddendly the partitions were mounted (I had to enter the passphrase for
the LUKS one again).


Syslog:

May 7 18:46:40 notebookneu kernel: [94610.179693] FAT-fs (sdb2): utf8 is not a
recommended IO charset for FAT filesystems, filesystem will be case sensitive!
May 7 18:46:40 notebookneu kernel: [94610.183430] FAT-fs (sdb2): Volume was
not properly unmounted. Some data may be corrupt. Please run fsck.
May 7 18:46:40 notebookneu udisksd[1467]: Mounted /dev/sdb2 (system) at
/media/usb1 on behalf of uid 1000
May 7 18:46:40 notebookneu org.gtk.Private.UDisks2VolumeMonitor[2197]:
index_parse.c:190: indx_parse(): error opening /media/usb1/BDMV/index.bdmv
May 7 18:46:40 notebookneu org.gtk.Private.UDisks2VolumeMonitor[2197]:
index_parse.c:190: indx_parse(): error opening
/media/usb1/BDMV/BACKUP/index.bdmv
May 7 18:46:48 notebookneu udisksd[1467]: Unlocked LUKS device /dev/sdb1 as
/dev/dm-0
May 7 18:46:49 notebookneu kernel: [94619.917965] EXT4-fs (dm-0): recovery
complete
May 7 18:46:49 notebookneu kernel: [94619.919765] EXT4-fs (dm-0): mounted
filesystem with ordered data mode. Opts: (null)
May 7 18:46:50 notebookneu org.gtk.Private.UDisks2VolumeMonitor[2197]:
index_parse.c:190: indx_parse(): error opening
/media/styxxx/ChiliGreen/BDMV/index.bdmv
May 7 18:46:50 notebookneu org.gtk.Private.UDisks2VolumeMonitor[2197]:
index_parse.c:190: indx_parse(): error opening
/media/styxxx/ChiliGreen/BDMV/BACKUP/index.bdmv
May 7 18:46:50 notebookneu udisksd[1467]: Mounted /dev/dm-0 at
/media/styxxx/ChiliGreen on behalf of uid 1000


There seems to be a problem with LUKS and udisk (actually happend a few times
that the LUKS partition couldn't be remounted until I rebooted). But also the
gvfs-udisk2-volume-monitor crashed what shouldn't be the case. So this might
also be a gvfs bug.
Notable is the line " index_parse.c:190: indx_parse(): error opening
/media/[...]/BDMV/BACKUP/index.bdmv".



-- System Information:
Debian Release: 8.0
APT prefers testing
APT policy: (990, 'testing'), (500, 'testing-updates'), (500, 'stable-updates'), (500, 'stable')
Architecture: amd64 (x86_64)
Foreign Architectures: i386

Kernel: Linux 3.16.0-4-amd64 (SMP w/2 CPU cores)
Locale: LANG=de_DE.UTF-8, LC_CTYPE=de_DE.UTF-8 (charmap=UTF-8)
Shell: /bin/sh linked to /bin/dash
Init: systemd (via /run/systemd/system)

Versions of packages gvfs depends on:
ii gvfs-common 1.22.2-1
ii gvfs-daemons 1.22.2-1
ii gvfs-libs 1.22.2-1
ii libc6 2.19-18
ii libglib2.0-0 2.42.1-1
ii libudev1 215-17

gvfs recommends no packages.

Versions of packages gvfs suggests:
ii gvfs-backends 1.22.2-1

-- no debconf information


--
To UNSUBSCRIBE, email to debian-bugs-...@lists.debian.org
with a subject of "unsubscribe". Trouble? Contact listm...@lists.debian.org

gr

unread,
Nov 28, 2023, 6:10:05 PM11/28/23
to
Package: gvfs-daemons
Followup-For: Bug #784675
X-Debbugs-Cc: grazia...@virgilio.it

Dear Maintainer,

*** Reporter, please consider answering these questions, where appropriate ***

* What led up to the situation?

root@orpo:~# systemctl status udisks2.service
● udisks2.service - Disk Manager
Loaded: loaded (/lib/systemd/system/udisks2.service; enabled; preset: enabled)
Active: active (running) since Tue 2023-11-28 22:41:35 CET; 1h 14min ago
Docs: man:udisks(8)
Main PID: 761 (udisksd)
Tasks: 6 (limit: 3479)
Memory: 21.5M
CPU: 1.590s
CGroup: /system.slice/udisks2.service
└─761 /usr/libexec/udisks2/udisksd

nov 28 22:41:18 orpo systemd[1]: Starting udisks2.service - Disk Manager...
nov 28 22:41:20 orpo udisksd[761]: udisks daemon version 2.10.1 starting
nov 28 22:41:35 orpo systemd[1]: Started udisks2.service - Disk Manager.
nov 28 22:41:35 orpo udisksd[761]: Acquired the name org.freedesktop.UDisks2 on the system message bus
nov 28 22:42:54 orpo udisksd[761]: Error probing device: Error sending ATA command IDENTIFY DEVICE to '/dev/sdb': Unexpected >
0000: 00 00 00 00 00 00 00 00 00 00 00 00 00 00 00 00 ................
0010: 00 00 00 00 00 00 00 00 00 00 00 00 00 00 00 00 ................
(g-io-error-quark, 0)
nov 28 22:42:55 orpo udisksd[761]: Mounted /dev/sdb1 at /media/gr/Intenso_1979 on behalf of uid 1000
lines 1-20/20 (END)


root@orpo:~# journalctl -fn
...
nov 28 19:36:41 orpo kernel: usb 7-4.3: new SuperSpeed USB device number 4 using xhci_hcd
nov 28 19:36:41 orpo kernel: usb 7-4.3: New USB device found, idVendor=152d, idProduct=0579, bcdDevice= 1.00
nov 28 19:36:41 orpo kernel: usb 7-4.3: New USB device strings: Mfr=1, Product=2, SerialNumber=3
nov 28 19:36:41 orpo kernel: usb 7-4.3: Product: External USB 3.0
nov 28 19:36:41 orpo kernel: usb 7-4.3: Manufacturer: Intenso
nov 28 19:36:41 orpo kernel: usb 7-4.3: SerialNumber:
nov 28 19:36:41 orpo mtp-probe[1267]: checking bus 7, device 4: "/sys/devices/pci0000:00/0000:00:1c.0/0000:03:00.0/usb7/7-4/7-4.3"
nov 28 19:36:41 orpo mtp-probe[1267]: bus: 7, device: 4 was not an MTP device
nov 28 19:36:41 orpo kernel: usbcore: registered new interface driver usb-storage
nov 28 19:36:41 orpo kernel: scsi host4: uas
nov 28 19:36:41 orpo kernel: usbcore: registered new interface driver uas
nov 28 19:36:41 orpo kernel: scsi 4:0:0:0: Direct-Access Intenso External USB 3.0 1201 PQ: 0 ANSI: 6
nov 28 19:36:41 orpo kernel: sd 4:0:0:0: Attached scsi generic sg2 type 0
nov 28 19:36:46 orpo kernel: sd 4:0:0:0: [sdb] 3907029168 512-byte logical blocks: (2.00 TB/1.82 TiB)
nov 28 19:36:46 orpo kernel: sd 4:0:0:0: [sdb] 4096-byte physical blocks
nov 28 19:36:46 orpo kernel: sd 4:0:0:0: [sdb] Write Protect is off
nov 28 19:36:46 orpo kernel: sd 4:0:0:0: [sdb] Mode Sense: 53 00 00 08
nov 28 19:36:46 orpo kernel: sd 4:0:0:0: [sdb] Write cache: enabled, read cache: enabled, doesn't support DPO or FUA
nov 28 19:36:46 orpo kernel: sd 4:0:0:0: [sdb] Preferred minimum I/O size 4096 bytes
nov 28 19:36:46 orpo kernel: sd 4:0:0:0: [sdb] Optimal transfer size 33553920 bytes not a multiple of preferred minimum block size (4096 bytes)
nov 28 19:36:46 orpo kernel: sdb: sdb1
nov 28 19:36:46 orpo kernel: sd 4:0:0:0: [sdb] Attached SCSI disk
nov 28 19:36:46 orpo mtp-probe[1277]: checking bus 7, device 4: "/sys/devices/pci0000:00/0000:00:1c.0/0000:03:00.0/usb7/7-4/7-4.3"
nov 28 19:36:46 orpo mtp-probe[1277]: bus: 7, device: 4 was not an MTP device
nov 28 19:36:46 orpo udisksd[737]: Error probing device: Error sending ATA command IDENTIFY DEVICE to '/dev/sdb': Unexpected sense data returned:
0000: 00 00 00 00 00 00 00 00 00 00 00 00 00 00 00 00 ................
0010: 00 00 00 00 00 00 00 00 00 00 00 00 00 00 00 00 ................
(g-io-error-quark, 0)

* What exactly did you do (or not do) that was effective (or
ineffective)?
* What was the outcome of this action? DE Mate doesn't realize that a new volume was inserted.
* What outcome did you expect instead? An icon of external usb hd on desktop.

*** End of the template - remove these template lines ***


-- System Information:
Debian Release: trixie/sid
APT prefers testing
APT policy: (500, 'testing')
Architecture: amd64 (x86_64)

Kernel: Linux 6.5.0-4-amd64 (SMP w/2 CPU threads; PREEMPT)
Kernel taint flags: TAINT_CRAP
Locale: LANG=it_IT.UTF-8, LC_CTYPE=it_IT.UTF-8 (charmap=UTF-8), LANGUAGE not set
Shell: /bin/sh linked to /usr/bin/dash
Init: systemd (via /run/systemd/system)
LSM: AppArmor: enabled

Versions of packages gvfs-daemons depends on:
ii gvfs-common 1.52.1-1
ii gvfs-libs 1.52.1-1
ii libbluray2 1:1.3.4-1
ii libc6 2.37-12
ii libglib2.0-0 2.78.1-4
ii libgudev-1.0-0 238-3
ii libsecret-1-0 0.21.1-1
ii libsystemd0 254.5-1
ii libudisks2-0 2.10.1-4
ii lsof 4.95.0-1
ii udisks2 2.10.1-4

Versions of packages gvfs-daemons recommends:
ii dbus 1.14.10-3
ii gvfs 1.52.1-1

Versions of packages gvfs-daemons suggests:
ii gvfs-backends 1.52.1-1

-- no debconf information

0 new messages