Your message dated Fri, 26 Oct 2012 07:26:25 +0200
with message-id <[email protected]>
and subject line 90-seconds delay on reboot/shutdown when postfix is installed
has caused the Debian Bug report #635777,
regarding 90-seconds delay on reboot/shutdown when postfix is installed
to be marked as done.
This means that you claim that the problem has been dealt with.
If this is not the case it is now your responsibility to reopen the
Bug report if necessary, and/or fix the problem forthwith.
(NB: If you are a system administrator and have no idea what this
message is talking about, this may indicate a serious mail system
misconfiguration somewhere. Please contact [email protected]
immediately.)
--
635777: http://bugs.debian.org/cgi-bin/bugreport.cgi?bug=635777
Debian Bug Tracking System
Contact [email protected] with problems
--- Begin Message ---
Package: systemd
Version: 29-1
Severity: minor
Tags: sid
Hi,
I have a weird issue with systemd I cannot quite grasp. I think this is a bug,
but maybe someone more experienced can shed some light on it.
My new Mailserver-to-be is a KVM VM (on a Squeeze host), that has been installed
as a minimal squeeze system, then fully upgraded to wheezy, and then added sid
with a lower preference to be able to install systemd (basically util-linux,
udev
and systemd come from unstable).
After installing Postfix each shutdown of the VM is delayed by 90 seconds. I've
made a stab at debugging and I think there could be a systemd bug involved.
When looking at the process table while the system is shutting down, it is
spending the 90 seconds with the following processes:
root 922 0.0 0.2 124720 2096 pts/0 Ss 21:39 0:00 -bash
root 986 0.0 0.1 19000 1012 ? Ss 21:40 0:00
/lib/systemd/systemd-initctl
root 987 0.0 0.0 4060 544 ? Ss 21:40 0:00 /sbin/ifdown
eth0
root 988 0.0 0.0 4144 580 ? S 21:40 0:00 /bin/sh -c
run-parts /etc/network/if-down.d
root 989 0.0 0.0 4044 576 ? S 21:40 0:00 run-parts
/etc/network/if-down.d
root 991 0.0 0.0 4144 580 ? S 21:40 0:00 /bin/sh -e
/etc/network/if-down.d/postfix
root 998 0.0 0.0 4144 656 ? S 21:40 0:00 /bin/sh -e
/etc/init.d/postfix reload
root 1125 0.0 0.0 16676 652 ? Ss 21:40 0:00
/lib/systemd/systemd-kmsg-syslogd
root 1326 0.0 0.1 19116 976 ? S 21:40 0:00 /bin/systemctl
reload postfix.service
basically it is spending 90 seconds in systemctl reload postfix.service,
which is executed by /etc/network/if-down.d/postfix through redirection
of /etc/init.d/postfix.
systemctl at this point:
root@mail:~# systemctl
UNIT LOAD ACTIVE SUB JOB DESCRIPTION
dev-hugepages.automount loaded active waiting Huge Pages File
System Automount Point
dev-mqueue.automount loaded active waiting POSIX Message
Queue File System Automount Point
lib-init-rw.automount loaded active waiting Debian early rw
Automount Point
proc-sys...misc.automount loaded active waiting Arbitrary
Executable File Formats File System Automount Point
sys-kern...ebug.automount loaded active waiting Debug File
System Automount Point
sys-kern...rity.automount loaded active waiting Security File
System Automount Point
sys-devi...ock-sr0.device loaded active plugged QEMU_DVD-ROM
sys-devi...et-eth0.device loaded active plugged Virtio network
device
sys-devi...da-vda1.device loaded active plugged
/sys/devices/pci0000:00/0000:00:04.0/virtio1/block/vda/vda1
sys-devi...da-vda2.device loaded active plugged
/sys/devices/pci0000:00/0000:00:04.0/virtio1/block/vda/vda2
sys-devi...da-vda5.device loaded active plugged
/sys/devices/pci0000:00/0000:00:04.0/virtio1/block/vda/vda5
sys-devi...ock-vda.device loaded active plugged
/sys/devices/pci0000:00/0000:00:04.0/virtio1/block/vda
sys-devi...y-ttyS0.device loaded active plugged
/sys/devices/platform/serial8250/tty/ttyS0
sys-devi...y-ttyS1.device loaded active plugged
/sys/devices/platform/serial8250/tty/ttyS1
sys-devi...y-ttyS2.device loaded active plugged
/sys/devices/platform/serial8250/tty/ttyS2
sys-devi...y-ttyS3.device loaded active plugged
/sys/devices/platform/serial8250/tty/ttyS3
sys-devi...ty-tty0.device loaded active plugged
/sys/devices/virtual/tty/tty0
sys-devi...ty-tty1.device loaded active plugged
/sys/devices/virtual/tty/tty1
sys-devi...y-tty10.device loaded active plugged
/sys/devices/virtual/tty/tty10
sys-devi...y-tty11.device loaded active plugged
/sys/devices/virtual/tty/tty11
sys-devi...y-tty12.device loaded active plugged
/sys/devices/virtual/tty/tty12
sys-devi...ty-tty2.device loaded active plugged
/sys/devices/virtual/tty/tty2
sys-devi...ty-tty3.device loaded active plugged
/sys/devices/virtual/tty/tty3
sys-devi...ty-tty4.device loaded active plugged
/sys/devices/virtual/tty/tty4
sys-devi...ty-tty5.device loaded active plugged
/sys/devices/virtual/tty/tty5
sys-devi...ty-tty6.device loaded active plugged
/sys/devices/virtual/tty/tty6
sys-devi...ty-tty7.device loaded active plugged
/sys/devices/virtual/tty/tty7
sys-devi...ty-tty8.device loaded active plugged
/sys/devices/virtual/tty/tty8
sys-devi...ty-tty9.device loaded active plugged
/sys/devices/virtual/tty/tty9
-.mount loaded active mounted /
media.mount loaded active mounted stop Media Directory
systemd-...d-console.path loaded active waiting stop Dispatch
Password Requests to Console Directory Watch
systemd-...word-wall.path loaded active waiting stop Forward Password
Requests to Wall Directory Watch
console-setup.service loaded active exited LSB: Set console
font and keymap
[email protected] loaded deactivating stop stop Start ifup for
eth0
ifupdown-clean.service loaded active exited LSB: Clean old
interface status info during boot.
ifupdown.service loaded active exited stop LSB: Prepare the
system for taking up interfaces.
kbd.service loaded active exited LSB: Prepare
console
keyboard-setup.service loaded active exited LSB: Set
preliminary keymap
mountoverflowtmp.service loaded active exited LSB: mount
emergency /tmp.
networking.service loaded active exited stop LSB: Raise
network interfaces.
postfix.service loaded inactive dead reload LSB: start and
stop the Postfix Mail Transport Agent
reboot.service loaded inactive dead start Reboot
remount-rootfs.service loaded active exited stop Remount Root FS
ssh.service loaded failed failed LSB: OpenBSD
Secure Shell server
systemd-initctl.service loaded active running /dev/initctl
Compatibility Daemon
systemd-...yslogd.service loaded active running Syslog Kernel
Log Buffer Bridge
systemd-logger.service loaded active running Stdio Syslog
Bridge
systemd-...s-load.service loaded active exited stop Load Kernel
Modules
systemd-...pi-vfs.service loaded active exited stop Remount API VFS
systemd-sysctl.service loaded active exited stop Apply Kernel
Variables
systemd-...-setup.service loaded active exited Recreate
Volatile Files and Directories
systemd-...utdown.service loaded inactive dead start Notify Audit
System and Update UTMP about System Shutdown
udev-trigger.service loaded active exited udev Coldplug
all Devices
udev.service loaded active running udev Kernel
Device Manager
syslog.socket loaded active running Syslog Socket
systemd-initctl.socket loaded active running /dev/initctl
Compatibility Named Pipe
systemd-logger.socket loaded active running Stdio Syslog
Bridge Socket
systemd-shutdownd.socket loaded active listening Delayed Shutdown
Socket
udev-control.socket loaded active listening udev Control
Socket
udev-kernel.socket loaded active listening udev Kernel
Socket
dev-disk...68bd493be.swap loaded active active stop
/dev/disk/by-uuid/e7e860ca-18ba-4aa3-a495-f9968bd493be
basic.target loaded active active stop Basic System
final.target loaded inactive dead start Final Step
local-fs.target loaded active active stop Local File
Systems
reboot.target loaded inactive dead start Reboot
shutdown.target loaded inactive dead start Shutdown
sockets.target loaded active active stop Sockets
swap.target loaded active active stop Swap
sysinit.target loaded active active stop System
Initialization
syslog.target loaded active active Syslog
umount.target loaded inactive dead start Unmount All
Filesystems
systemd-...es-clean.timer loaded active waiting stop Daily Cleanup of
Temporary Directories
I think it is a systemd bug, because I have found two ways to solve
this problem:
a) add export _SYSTEMCTL_SKIP_REDIRECT="true" to /etc/network/if-down.d/postfix
to avoid the systemctl redirection in the initscript. Which makes me believe
it is not the code in the initscript itself that is creating this delay
b) add sleep 1 to the top of this script.
I think the problem is a race condition. I think systemd treats postfix.service
as stopped and continues to deactivating [email protected]. Which executes the
ifdown-
script. At least at the beginning of this script postfix must still be running,
otherwise it would not execute postfix reload at all. It seems that issuing
reload
on a service that has just died (or is in process of dying) could cause this
problem.
Do you need any more information to reproduce this?
Bernhard
-- System Information:
Debian Release: wheezy/sid
APT prefers testing
APT policy: (900, 'testing'), (800, 'unstable')
Architecture: amd64 (x86_64)
Kernel: Linux 2.6.39-2-amd64 (SMP w/2 CPU cores)
Locale: LANG=en_US.UTF-8, LC_CTYPE=en_US.UTF-8 (charmap=UTF-8)
Shell: /bin/sh linked to /bin/dash
Versions of packages systemd depends on:
ii initscripts 2.88dsf-13.11 scripts for initializing and shutt
ii libaudit0 1.7.13-1.2 Dynamic library for security audit
ii libc6 2.13-10 Embedded GNU C Library: Shared lib
ii libcap2 1:2.21-2 support for getting/setting POSIX.
ii libcryptsetup1 2:1.3.0-3 libcryptsetup shared library
ii libdbus-1-3 1.4.12-5 simple interprocess messaging syst
ii libpam0g 1.1.3-2 Pluggable Authentication Modules l
ii libselinux1 2.0.98-1.1 SELinux runtime shared libraries
ii libudev0 172-1 libudev shared library
ii libwrap0 7.6.q-21 Wietse Venema's TCP wrappers libra
ii udev 172-1 /dev/ and hotplug management daemo
ii util-linux 2.19.1-4 Miscellaneous system utilities
Versions of packages systemd recommends:
pn libpam-systemd <none> (no description available)
Versions of packages systemd suggests:
ii python 2.6.7-1 interactive high-level object-orie
pn systemd-gui <none> (no description available)
-- no debconf information
--- End Message ---
--- Begin Message ---
Version: 44-5
systemd (44-5) unstable; urgency=low
* Team upload.
[ Tollef Fog Heen ]
* disable killing on entering START_PRE, START, thanks to Michael
Stapelberg for patch. This avoids killing VMs run through libvirt
when restarting libvirtd. Closes: #688635.
* Avoid reloading services when shutting down, since that won't work and
makes no sense. Thanks to Michael Stapelberg for the patch.
Closes: #635777.
* Try to determine which init scripts support the reload action
heuristically. Closes: #686115, #650382.
[ Michael Biebl ]
* Update Vcs-* fields, the Git repository is hosted on alioth now. Set the
default branch to "debian".
* Avoid reload and (re)start requests during early boot which can lead to
deadlocks. Closes: #624599
* Make systemd-cgroup work even if not all cgroup mounts are available on
startup. Closes: #690916
* Fix typos in the systemd.path and systemd.unit man page. Closes: #668344
* Add watch file to track new upstream releases.
-- Michael Biebl <[email protected]> Thu, 25 Oct 2012 21:41:23 +0200
--
Why is it that all of the instruments seeking intelligent life in the
universe are pointed away from Earth?
signature.asc
Description: OpenPGP digital signature
--- End Message ---
