I reproduced the problem and collected some interesting information:

backtrace from the hanging "snap run ..."

Apr 08 18:45:22 test-snapd lxd.daemon[1254]: SIGABRT: abort
Apr 08 18:45:22 test-snapd lxd.daemon[1254]: PC=0xaaaad3c56de4 m=0 sigcode=0
Apr 08 18:45:22 test-snapd lxd.daemon[1254]: goroutine 0 [idle]:
Apr 08 18:45:22 test-snapd lxd.daemon[1254]: runtime.futex(0xaaaad47faa88, 0x0, 
0x0, 0x0, 0xaaaa00000000, 0xaaaad3c1de38, 0xaaaad47fa5e8, 0x0, 0x0, 
0xaaaad3c326e8, ...)
Apr 08 18:45:22 test-snapd lxd.daemon[1254]:         
/usr/lib/go-1.10/src/runtime/sys_linux_arm64.s:321 +0x1c
Apr 08 18:45:22 test-snapd lxd.daemon[1254]: runtime.futexsleep(0xaaaad47faa88, 
0xaaaa00000000, 0xffffffffffffffff)
Apr 08 18:45:22 test-snapd lxd.daemon[1254]:         
/usr/lib/go-1.10/src/runtime/os_linux.go:45 +0x3c
Apr 08 18:45:22 test-snapd lxd.daemon[1254]: runtime.notesleep(0xaaaad47faa88)
Apr 08 18:45:22 test-snapd lxd.daemon[1254]:         
/usr/lib/go-1.10/src/runtime/lock_futex.go:151 +0x84
Apr 08 18:45:22 test-snapd lxd.daemon[1254]: runtime.stopm()
Apr 08 18:45:22 test-snapd lxd.daemon[1254]:         
/usr/lib/go-1.10/src/runtime/proc.go:1952 +0xa0
Apr 08 18:45:22 test-snapd lxd.daemon[1254]: runtime.findrunnable(0x442003c000, 
0x0)
Apr 08 18:45:22 test-snapd lxd.daemon[1254]:         
/usr/lib/go-1.10/src/runtime/proc.go:2415 +0x514
Apr 08 18:45:22 test-snapd lxd.daemon[1254]: runtime.schedule()
Apr 08 18:45:22 test-snapd lxd.daemon[1254]:         
/usr/lib/go-1.10/src/runtime/proc.go:2541 +0xe8
Apr 08 18:45:22 test-snapd lxd.daemon[1254]: runtime.park_m(0x44203c8300)
Apr 08 18:45:22 test-snapd lxd.daemon[1254]:         
/usr/lib/go-1.10/src/runtime/proc.go:2604 +0x90
Apr 08 18:45:22 test-snapd lxd.daemon[1254]: runtime.mcall(0x0)
Apr 08 18:45:22 test-snapd lxd.daemon[1254]:         
/usr/lib/go-1.10/src/runtime/asm_arm64.s:169 +0x50
Apr 08 18:45:22 test-snapd lxd.daemon[1254]: goroutine 1 [select]:
Apr 08 18:45:22 test-snapd lxd.daemon[1254]: 
github.com/snapcore/snapd/client.(*Client).do(0x44201149a0, 0xaaaad4116c66, 
0x3, 0xaaaad41220ce, 0xf, 0x0, 0x0, 0x0, 0x0, 0xaaaad43dd140, ...)
Apr 08 18:45:22 test-snapd lxd.daemon[1254]:         
/build/snapd-C2KffO/snapd-2.44.1/_build/src/github.com/snapcore/snapd/client/client.go:334
 +0x1f8
Apr 08 18:45:22 test-snapd lxd.daemon[1254]: 
github.com/snapcore/snapd/client.(*Client).doSync(0x44201149a0, 0xaaaad4116c66, 
0x3, 0xaaaad41220ce, 0xf, 0x0, 0x0, 0x0, 0x0, 0xaaaad438ffa0, ...)
Apr 08 18:45:22 test-snapd lxd.daemon[1254]:         
/build/snapd-C2KffO/snapd-2.44.1/_build/src/github.com/snapcore/snapd/client/client.go:374
 +0x8c
Apr 08 18:45:22 test-snapd lxd.daemon[1254]: 
github.com/snapcore/snapd/client.(*Client).SysInfo(0x44201149a0, 0x0, 
0xaaaad44c1ee0, 0x44203e4430)
Apr 08 18:45:22 test-snapd lxd.daemon[1254]:         
/build/snapd-C2KffO/snapd-2.44.1/_build/src/github.com/snapcore/snapd/client/client.go:655
 +0x80
Apr 08 18:45:22 test-snapd lxd.daemon[1254]: 
main.maybeWaitForSecurityProfileRegeneration(0x44201149a0, 0x442027b9c8, 
0xaaaad3cf2768)
Apr 08 18:45:22 test-snapd lxd.daemon[1254]:         
/build/snapd-C2KffO/snapd-2.44.1/_build/src/github.com/snapcore/snapd/cmd/snap/cmd_run.go:149
 +0xd4
Apr 08 18:45:22 test-snapd lxd.daemon[1254]: 
main.(*cmdRun).Execute(0x4420318310, 0x4420346af0, 0x0, 0x2, 0x4420318310, 0x1)
Apr 08 18:45:22 test-snapd lxd.daemon[1254]:         
/build/snapd-C2KffO/snapd-2.44.1/_build/src/github.com/snapcore/snapd/cmd/snap/cmd_run.go:185
 +0x10c
Apr 08 18:45:22 test-snapd lxd.daemon[1254]: 
github.com/snapcore/snapd/vendor/github.com/jessevdk/go-flags.(*Parser).ParseArgs(0x44202e4ee0,
 0x4420030110, 0x3, 0x3, 0x0, 0x0, 0x0, 0x0, 0x0)
Apr 08 18:45:22 test-snapd lxd.daemon[1254]:         
/build/snapd-C2KffO/snapd-2.44.1/_build/src/github.com/snapcore/snapd/vendor/github.com/jessevdk/go-flags/parser.go:333
 +0x678
Apr 08 18:45:22 test-snapd lxd.daemon[1254]: 
github.com/snapcore/snapd/vendor/github.com/jessevdk/go-flags.(*Parser).Parse(0x44202e4ee0,
 0x44202e4ee0, 0xaaaad47fa940, 0xffff84495000, 0x0, 0x4420105a78)
Apr 08 18:45:22 test-snapd systemd[1]: snap.lxd.daemon.service: Control process 
exited, code=exited status=2
Apr 08 18:45:22 test-snapd lxd.daemon[1254]:         
/build/snapd-C2KffO/snapd-2.44.1/_build/src/github.com/snapcore/snapd/vendor/github.com/jessevdk/go-flags/parser.go:190
 +0x70
Apr 08 18:45:22 test-snapd lxd.daemon[1254]: main.run(0x4400000000, 
0xaaaad44bd4c8)
Apr 08 18:45:22 test-snapd lxd.daemon[1254]:         
/build/snapd-C2KffO/snapd-2.44.1/_build/src/github.com/snapcore/snapd/cmd/snap/main.go:515
 +0x3c
Apr 08 18:45:22 test-snapd lxd.daemon[1254]: main.main()
Apr 08 18:45:22 test-snapd lxd.daemon[1254]:         
/build/snapd-C2KffO/snapd-2.44.1/_build/src/github.com/snapcore/snapd/cmd/snap/main.go:482
 +0x2a0
Apr 08 18:45:22 test-snapd lxd.daemon[1254]: goroutine 5 [syscall, 7 minutes]:
Apr 08 18:45:22 test-snapd lxd.daemon[1254]: os/signal.signal_recv(0x0)
Apr 08 18:45:22 test-snapd lxd.daemon[1254]:         
/usr/lib/go-1.10/src/runtime/sigqueue.go:139 +0xc8
Apr 08 18:45:22 test-snapd lxd.daemon[1254]: os/signal.loop()
Apr 08 18:45:22 test-snapd lxd.daemon[1254]:         
/usr/lib/go-1.10/src/os/signal/signal_unix.go:22 +0x18
Apr 08 18:45:22 test-snapd lxd.daemon[1254]: created by os/signal.init.0
Apr 08 18:45:22 test-snapd lxd.daemon[1254]:         
/usr/lib/go-1.10/src/os/signal/signal_unix.go:28 +0x30
Apr 08 18:45:22 test-snapd lxd.daemon[1254]: r0      0xaaaad47faa88
Apr 08 18:45:22 test-snapd lxd.daemon[1254]: r1      0x0
Apr 08 18:45:22 test-snapd lxd.daemon[1254]: r2      0x0
Apr 08 18:45:22 test-snapd lxd.daemon[1254]: r3      0x0
Apr 08 18:45:22 test-snapd lxd.daemon[1254]: r4      0x0
Apr 08 18:45:22 test-snapd lxd.daemon[1254]: r5      0x0
Apr 08 18:45:22 test-snapd lxd.daemon[1254]: r6      0x14
Apr 08 18:45:22 test-snapd lxd.daemon[1254]: r7      0x0
Apr 08 18:45:22 test-snapd lxd.daemon[1254]: r8      0x62
Apr 08 18:45:22 test-snapd lxd.daemon[1254]: r9      0xa
Apr 08 18:45:22 test-snapd lxd.daemon[1254]: r10     0x8
Apr 08 18:45:22 test-snapd lxd.daemon[1254]: r11     0x4420030040
Apr 08 18:45:22 test-snapd lxd.daemon[1254]: r12     0x2
Apr 08 18:45:22 test-snapd lxd.daemon[1254]: r13     0x0
Apr 08 18:45:22 test-snapd lxd.daemon[1254]: r14     0x0
Apr 08 18:45:22 test-snapd lxd.daemon[1254]: r15     0x0
Apr 08 18:45:22 test-snapd lxd.daemon[1254]: r16     0xffffdda95ab0
Apr 08 18:45:22 test-snapd lxd.daemon[1254]: r17     0x44203f25a0
Apr 08 18:45:22 test-snapd lxd.daemon[1254]: r18     0xffff84628a70
Apr 08 18:45:22 test-snapd lxd.daemon[1254]: r19     0x6e
Apr 08 18:45:22 test-snapd lxd.daemon[1254]: r20     0x44202bc1d0
Apr 08 18:45:22 test-snapd lxd.daemon[1254]: r21     0x44202c8cd8
Apr 08 18:45:22 test-snapd lxd.daemon[1254]: r22     0x0
Apr 08 18:45:22 test-snapd lxd.daemon[1254]: r23     0xaaaad47bd1a0
Apr 08 18:45:22 test-snapd lxd.daemon[1254]: r24     0x0
Apr 08 18:45:22 test-snapd lxd.daemon[1254]: r25     0x0
Apr 08 18:45:22 test-snapd lxd.daemon[1254]: r26     0xffffdda95d90
Apr 08 18:45:22 test-snapd lxd.daemon[1254]: r27     0x0
Apr 08 18:45:22 test-snapd lxd.daemon[1254]: r28     0xaaaad47fa200
Apr 08 18:45:22 test-snapd lxd.daemon[1254]: r29     0xffffdda95e70
Apr 08 18:45:22 test-snapd lxd.daemon[1254]: lr      0xaaaad3c2a7f4
Apr 08 18:45:22 test-snapd lxd.daemon[1254]: sp      0xffffdda95c60
Apr 08 18:45:22 test-snapd lxd.daemon[1254]: pc      0xaaaad3c56de4
Apr 08 18:45:22 test-snapd lxd.daemon[1254]: fault   0x0


Time of the current revision of the core snap being unmounted, correlated with 
the re-exec operation:

Apr 08 18:37:45.080849 test-snapd lxd.daemon[1254]: cmd_linux.go:224: DEBUG: 
restarting into "/snap/core/current/usr/bin/snap"
Apr 08 18:37:45.090599 test-snapd systemd[1]: Unmounting Mount unit for core, 
revision 8937...
Apr 08 18:37:45.101991 test-snapd systemd[1]: Unmounted Mount unit for core, 
revision 8937.

/proc/PID/maps of that process at the time of being stuck:

root@test-snapd:~# cat /proc/1254/maps
4000000000-4000002000 rw-p 00000000 00:00 0 
441ffc8000-4420700000 rw-p 00000000 00:00 0 
aaaad38f6000-aaaad4223000 r-xp 00000000 07:00 2936                       
/usr/bin/snap
aaaad4232000-aaaad47b3000 r--p 0092c000 07:00 2936                       
/usr/bin/snap
aaaad47b3000-aaaad47f6000 rw-p 00ead000 07:00 2936                       
/usr/bin/snap
aaaad47f6000-aaaad481b000 rw-p 00000000 00:00 0 
aaaaf9a85000-aaaaf9aa6000 rw-p 00000000 00:00 0                          [heap]
ffff30000000-ffff30021000 rw-p 00000000 00:00 0 
ffff30021000-ffff34000000 ---p 00000000 00:00 0 
ffff34000000-ffff34021000 rw-p 00000000 00:00 0 
ffff34021000-ffff38000000 ---p 00000000 00:00 0 
ffff38000000-ffff38021000 rw-p 00000000 00:00 0 
ffff38021000-ffff3c000000 ---p 00000000 00:00 0 
ffff3e7fd000-ffff3e7fe000 ---p 00000000 00:00 0 
ffff3e7fe000-ffff3effe000 rw-p 00000000 00:00 0 
ffff3effe000-ffff3efff000 ---p 00000000 00:00 0 
ffff3efff000-ffff3f7ff000 rw-p 00000000 00:00 0 
ffff3f7ff000-ffff3f800000 ---p 00000000 00:00 0 
ffff3f800000-ffff40000000 rw-p 00000000 00:00 0 
ffff40000000-ffff40021000 rw-p 00000000 00:00 0 
ffff40021000-ffff44000000 ---p 00000000 00:00 0 
ffff44000000-ffff44021000 rw-p 00000000 00:00 0 
ffff44021000-ffff48000000 ---p 00000000 00:00 0 
ffff48000000-ffff48021000 rw-p 00000000 00:00 0 
ffff48021000-ffff4c000000 ---p 00000000 00:00 0 
ffff4c000000-ffff4c021000 rw-p 00000000 00:00 0 
ffff4c021000-ffff50000000 ---p 00000000 00:00 0 
ffff50000000-ffff50021000 rw-p 00000000 00:00 0 
ffff50021000-ffff54000000 ---p 00000000 00:00 0 
ffff54000000-ffff54021000 rw-p 00000000 00:00 0 
ffff54021000-ffff58000000 ---p 00000000 00:00 0 
ffff58000000-ffff58021000 rw-p 00000000 00:00 0 
ffff58021000-ffff5c000000 ---p 00000000 00:00 0 
ffff5c000000-ffff5c021000 rw-p 00000000 00:00 0 
ffff5c021000-ffff60000000 ---p 00000000 00:00 0 
ffff607f9000-ffff607fa000 ---p 00000000 00:00 0 
ffff607fa000-ffff60ffa000 rw-p 00000000 00:00 0 
ffff60ffa000-ffff60ffb000 ---p 00000000 00:00 0 
ffff60ffb000-ffff617fb000 rw-p 00000000 00:00 0 
ffff617fb000-ffff617fc000 ---p 00000000 00:00 0 
ffff617fc000-ffff61ffc000 rw-p 00000000 00:00 0 
ffff61ffc000-ffff61ffd000 ---p 00000000 00:00 0 
ffff61ffd000-ffff627fd000 rw-p 00000000 00:00 0 
ffff627fd000-ffff627fe000 ---p 00000000 00:00 0 
ffff627fe000-ffff62ffe000 rw-p 00000000 00:00 0 
ffff62ffe000-ffff62fff000 ---p 00000000 00:00 0 
ffff62fff000-ffff637ff000 rw-p 00000000 00:00 0 
ffff637ff000-ffff63800000 ---p 00000000 00:00 0 
ffff63800000-ffff64000000 rw-p 00000000 00:00 0 
ffff64000000-ffff64021000 rw-p 00000000 00:00 0 
ffff64021000-ffff68000000 ---p 00000000 00:00 0 
ffff68000000-ffff68021000 rw-p 00000000 00:00 0 
ffff68021000-ffff6c000000 ---p 00000000 00:00 0 
ffff6c000000-ffff6c021000 rw-p 00000000 00:00 0 
ffff6c021000-ffff70000000 ---p 00000000 00:00 0 
ffff70000000-ffff70021000 rw-p 00000000 00:00 0 
ffff70021000-ffff74000000 ---p 00000000 00:00 0 
ffff74000000-ffff74021000 rw-p 00000000 00:00 0 
ffff74021000-ffff78000000 ---p 00000000 00:00 0 
ffff78000000-ffff78021000 rw-p 00000000 00:00 0 
ffff78021000-ffff7c000000 ---p 00000000 00:00 0 
ffff7c000000-ffff7c021000 rw-p 00000000 00:00 0 
ffff7c021000-ffff80000000 ---p 00000000 00:00 0 
ffff80134000-ffff80374000 rw-p 00000000 00:00 0 
ffff80374000-ffff80375000 ---p 00000000 00:00 0 
ffff80375000-ffff80b75000 rw-p 00000000 00:00 0 
ffff80b75000-ffff80b76000 ---p 00000000 00:00 0 
ffff80b76000-ffff81376000 rw-p 00000000 00:00 0 
ffff81376000-ffff81380000 r-xp 00000000 08:02 1356                       
/lib/aarch64-linux-gnu/libnss_files-2.27.so
ffff81380000-ffff8138f000 ---p 0000a000 08:02 1356                       
/lib/aarch64-linux-gnu/libnss_files-2.27.so
ffff8138f000-ffff81390000 r--p 00009000 08:02 1356                       
/lib/aarch64-linux-gnu/libnss_files-2.27.so
ffff81390000-ffff81391000 rw-p 0000a000 08:02 1356                       
/lib/aarch64-linux-gnu/libnss_files-2.27.so
ffff81391000-ffff81397000 rw-p 00000000 00:00 0 
ffff81397000-ffff813a9000 r-xp 00000000 08:02 1353                       
/lib/aarch64-linux-gnu/libnsl-2.27.so
ffff813a9000-ffff813b8000 ---p 00012000 08:02 1353                       
/lib/aarch64-linux-gnu/libnsl-2.27.so
ffff813b8000-ffff813b9000 r--p 00011000 08:02 1353                       
/lib/aarch64-linux-gnu/libnsl-2.27.so
ffff813b9000-ffff813ba000 rw-p 00012000 08:02 1353                       
/lib/aarch64-linux-gnu/libnsl-2.27.so
ffff813ba000-ffff813bc000 rw-p 00000000 00:00 0 
ffff813bc000-ffff813c6000 r-xp 00000000 08:02 1358                       
/lib/aarch64-linux-gnu/libnss_nis-2.27.so
ffff813c6000-ffff813d5000 ---p 0000a000 08:02 1358                       
/lib/aarch64-linux-gnu/libnss_nis-2.27.so
ffff813d5000-ffff813d6000 r--p 00009000 08:02 1358                       
/lib/aarch64-linux-gnu/libnss_nis-2.27.so
ffff813d6000-ffff813d7000 rw-p 0000a000 08:02 1358                       
/lib/aarch64-linux-gnu/libnss_nis-2.27.so
ffff813d7000-ffff813de000 r-xp 00000000 08:02 1354                       
/lib/aarch64-linux-gnu/libnss_compat-2.27.so
ffff813de000-ffff813ed000 ---p 00007000 08:02 1354                       
/lib/aarch64-linux-gnu/libnss_compat-2.27.so
ffff813ed000-ffff813ee000 r--p 00006000 08:02 1354                       
/lib/aarch64-linux-gnu/libnss_compat-2.27.so
ffff813ee000-ffff813ef000 rw-p 00007000 08:02 1354                       
/lib/aarch64-linux-gnu/libnss_compat-2.27.so
ffff813ef000-ffff813f0000 ---p 00000000 00:00 0 
ffff813f0000-ffff81c70000 rw-p 00000000 00:00 0 
ffff81c70000-ffff81c71000 ---p 00000000 00:00 0 
ffff81c71000-ffff82471000 rw-p 00000000 00:00 0 
ffff82471000-ffff82472000 ---p 00000000 00:00 0 
ffff82472000-ffff82c72000 rw-p 00000000 00:00 0 
ffff82c72000-ffff82c73000 ---p 00000000 00:00 0 
ffff82c73000-ffff83473000 rw-p 00000000 00:00 0 
ffff83473000-ffff83474000 ---p 00000000 00:00 0 
ffff83474000-ffff83c74000 rw-p 00000000 00:00 0 
ffff83c74000-ffff83c75000 ---p 00000000 00:00 0 
ffff83c75000-ffff844d5000 rw-p 00000000 00:00 0 
ffff844d5000-ffff84615000 r-xp 00000000 08:02 1319                       
/lib/aarch64-linux-gnu/libc-2.27.so
ffff84615000-ffff84624000 ---p 00140000 08:02 1319                       
/lib/aarch64-linux-gnu/libc-2.27.so
ffff84624000-ffff84628000 r--p 0013f000 08:02 1319                       
/lib/aarch64-linux-gnu/libc-2.27.so
ffff84628000-ffff8462a000 rw-p 00143000 08:02 1319                       
/lib/aarch64-linux-gnu/libc-2.27.so
ffff8462a000-ffff8462e000 rw-p 00000000 00:00 0 
ffff8462e000-ffff84645000 r-xp 00000000 08:02 1367                       
/lib/aarch64-linux-gnu/libpthread-2.27.so
ffff84645000-ffff84654000 ---p 00017000 08:02 1367                       
/lib/aarch64-linux-gnu/libpthread-2.27.so
ffff84654000-ffff84655000 r--p 00016000 08:02 1367                       
/lib/aarch64-linux-gnu/libpthread-2.27.so
ffff84655000-ffff84656000 rw-p 00017000 08:02 1367                       
/lib/aarch64-linux-gnu/libpthread-2.27.so
ffff84656000-ffff8465a000 rw-p 00000000 00:00 0 
ffff8465a000-ffff84677000 r-xp 00000000 08:02 1303                       
/lib/aarch64-linux-gnu/ld-2.27.so
ffff8467c000-ffff84680000 rw-p 00000000 00:00 0 
ffff84684000-ffff84685000 r--p 00000000 00:00 0                          [vvar]
ffff84685000-ffff84686000 r-xp 00000000 00:00 0                          [vdso]
ffff84686000-ffff84687000 r--p 0001c000 08:02 1303                       
/lib/aarch64-linux-gnu/ld-2.27.so
ffff84687000-ffff84689000 rw-p 0001d000 08:02 1303                       
/lib/aarch64-linux-gnu/ld-2.27.so
ffffdda76000-ffffdda97000 rw-p 00000000 00:00 0                          [stack]

-- 
You received this bug notification because you are a member of Ubuntu
Bugs, which is subscribed to Ubuntu.
https://bugs.launchpad.net/bugs/1871652

Title:
  Daemon snaps not properly stopped in some cases

To manage notifications about this bug go to:
https://bugs.launchpad.net/snapd/+bug/1871652/+subscriptions

-- 
ubuntu-bugs mailing list
ubuntu-bugs@lists.ubuntu.com
https://lists.ubuntu.com/mailman/listinfo/ubuntu-bugs

Reply via email to