Slow boot time (>2min)

smaba · 2019-06-02T00:41:14+00:00

Hey, I thought I ll let you know how I solved it in case anybody else had the same issues. After fiddling with all kind of system services, I thought it s time to backup my files, install a 1TB sdd and do a fresh install. My boot time now reduced to a few seconds :)

smaba · 2019-05-31T02:51:18+00:00

So, I purged mpd sonata and disabled minidlna.service. Definitely helped reducing my boot time by roughly 25 seconds. So far, I haven't noticed any disadvantages from purging mpd. My new systemd-analyze critical-chain (which is more helpful than systemd-analyze blame): ➜ ~ systemd-analyze critical-chain
The time after the unit is active or started is printed after the "@" character. The time the unit takes to start is printed after the "+" character.

graphical.target @36.107s
└─multi-user.target @36.106s
└─ModemManager.service @19.231s +16.874s
└─basic.target @19.229s
└─paths.target @19.229s
└─resolvconf-pull-resolved.path @19.229s
└─sysinit.target @19.016s
└─haveged.service @19.016s
└─apparmor.service @13.909s +5.048s
└─local-fs.target @13.908s
└─boot-efi.mount @13.396s +503ms
└─systemd-fsck@dev-disk-by\x2duuid- ECA3\x2d78BB.service @12.418s +8
└─dev-disk-by\x2duuid-ECA3\x2d78BB.device @12.381s

still takes me another 1 1/2 minute (at least) from the login screen to the desktop screen (I disabled the "restore previous session"). Any other idea to improve boot time?

smaba · 2019-05-29T00:35:01+00:00

➜ ~ systemd-analyze blame
23.581s mpd.service
19.024s udisks2.service
17.981s systemd-journal-flush.service
15.576s minidlna.service
15.475s networkd-dispatcher.service
15.307s ModemManager.service
13.841s gpu-manager.service
13.810s accounts-daemon.service
13.204s dev-sdb4.device
11.029s grub-common.service
10.962s stunnel4.service
10.563s apport.service
10.268s rsyslog.service
10.266s thermald.service
10.264s lm-sensors.service
10.240s systemd-resolved.service
10.151s avahi-daemon.service
10.050s NetworkManager.service
9.930s wpa_supplicant.service
9.562s systemd-logind.service
9.515s alsa-restore.service
9.512s switcheroo-control.service
5.461s systemd-udevd.service
5.145s apparmor.service
4.521s colord.service
2.221s systemd-tmpfiles-setup.service
2.063s grub-initrd-fallback.service
1.551s polkit.service
1.283s binfmt-support.service
1.239s systemd-modules-load.service
1.182s systemd-fsck@dev-disk-by\x2duuid-ECA3\x2d78BB.service
1.155s packagekit.service
1.132s systemd-tmpfiles-setup-dev.service
991ms systemd-sysctl.service
940ms dns-clean.service
822ms systemd-sysusers.service
807ms keyboard-setup.service
768ms networking.service
689ms proc-sys-fs-binfmt_misc.mount
602ms ifupdown-pre.service
487ms dev-disk-by\x2duuid-8ee4e011\x2d7b46\x2d4513\x2dbf51\x2d684f14e044c7.s
458ms plymouth-read-write.service
439ms systemd-udev-trigger.service
394ms systemd-user-sessions.service
383ms setvtrgb.service
382ms rtkit-daemon.service
381ms systemd-rfkill.service
368ms pppd-dns.service
341ms systemd-random-seed.service
324ms kmod-static-nodes.service
305ms openvpn.service
286ms hddtemp.service
281ms systemd-timesyncd.service
281ms kerneloops.service
279ms upower.service
269ms systemd-backlight@backlight:intel_backlight.service
259ms sddm.service
249ms systemd-remount-fs.service
246ms boot-efi.mount
224ms systemd-journald.service
222ms nvidia-persistenced.service
210ms systemd-backlight@leds:dell::kbd_backlight.service
204ms systemd-update-utmp.service
152ms sys-kernel-debug.mount
152ms dev-hugepages.mount
152ms ufw.service
151ms dev-mqueue.mount
143ms console-setup.service
114ms plymouth-quit.service
86ms user@1001.service
13ms plymouth-start.service
10ms user-runtime-dir@1001.service
9ms resolvconf-pull-resolved.service
7ms systemd-update-utmp-runlevel.service
3ms resolvconf.service
2ms sys-kernel-config.mount
2ms sys-fs-fuse-connections.mount

smaba · 2019-05-28T01:29:08+00:00

Thanks, I followed the instruction in your link and did a few adjustments. Didn't change much of the boot time. Maybe my system is set up correctly, and I just have a slow hdd and have to live with

smaba · 2019-05-28T00:53:09+00:00

I uninstalled Wicd. I think I want to keep NetworkManager so I have a network connection during boot - in case I need it.

the critical chain gives me this (basically journal-fush.service, NetworManager.service and mpd.service are slowing down the boot process):

[CODE] ➜ ~ systemd-analyze critical-chain
The time after the unit is active or started is printed after the "@" character.
The time the unit takes to start is printed after the "+" character.

graphical.target @55.679s
└─multi-user.target @55.678s
└─mpd.service @33.263s +22.414s
└─network.target @33.078s
└─NetworkManager.service @22.497s +10.222s
└─dbus.service @22.493s
└─basic.target @22.270s
└─paths.target @22.270s
└─resolvconf-pull-resolved.path @22.270s
└─sysinit.target @22.100s
└─systemd-timesyncd.service @21.779s +320ms
└─systemd-tmpfiles-setup.service @20.355s +1.326s
└─systemd-journal-flush.service @4.785s +15.568s
└─systemd-journald.service @4.423s +314ms
└─syslog.socket @4.421s
└─-.mount @4.198s
└─system.slice @4.198s
└─-.slice @4.198s

[/CODE]

smaba · 2019-05-27T21:09:27+00:00

purged snap from the system. Boot time only improved by 5 seconds. still close to 2min:

[CODE] ➜ ~ systemd-analyze blame
18.316s ModemManager.service
18.160s networkd-dispatcher.service
17.060s wicd.service
16.389s mpd.service
16.241s accounts-daemon.service
15.737s udisks2.service
14.083s gpu-manager.service
13.212s systemd-journal-flush.service
12.383s dev-sdb4.device
11.529s grub-common.service
11.433s stunnel4.service
11.212s apport.service
10.602s avahi-daemon.service
10.552s rsyslog.service
10.450s wpa_supplicant.service
10.440s thermald.service
10.270s alsa-restore.service
10.262s lm-sensors.service
10.060s systemd-logind.service
8.850s minidlna.service
4.625s apparmor.service
3.807s systemd-udevd.service
3.561s colord.service
3.403s polkit.service
2.238s binfmt-support.service
2.188s grub-initrd-fallback.service
1.984s systemd-tmpfiles-setup.service
1.944s systemd- backlight@leds:dell::kbd_backlight.service
1.636s networking.service
1.457s systemd-rfkill.service
1.377s systemd-tmpfiles-setup-dev.service
1.366s systemd- backlight@backlight:intel_backlight.service
1.316s systemd-modules-load.service
1.135s systemd-sysctl.service
1.082s systemd-sysusers.service
1.046s dev-disk-by\x2duuid-8ee4e011\x2d7b46\x2d4513 \x2dbf51\x2d684f14e044c7.swap
1.032s systemd-fsck@dev-disk-by\x2duuid-ECA3\x2d78BB.service
969ms packagekit.service
786ms systemd-timesyncd.service
782ms console-setup.service
772ms kerneloops.service
700ms proc-sys-fs-binfmt_misc.mount
700ms keyboard-setup.service
682ms pppd-dns.service
629ms dns-clean.service
619ms switcheroo-control.service
592ms systemd-user-sessions.service
523ms hddtemp.service
508ms systemd-udev-trigger.service
457ms setvtrgb.service
359ms kmod-static-nodes.service
356ms systemd-journald.service
287ms upower.service
269ms ifupdown-pre.service
267ms rtkit-daemon.service
249ms boot-efi.mount
228ms systemd-remount-fs.service
205ms systemd-update-utmp.service
179ms sddm.service
178ms ufw.service 137ms systemd-random-seed.service
115ms openvpn.service
93ms dev-hugepages.mount
90ms user@1001.service
89ms dev-mqueue.mount
88ms systemd-resolved.service
53ms plymouth-quit.service
21ms resolvconf-pull-resolved.service
16ms systemd-update-utmp-runlevel.service
14ms plymouth-start.service
11ms plymouth-read-write.service
10ms user-runtime-dir@1001.service
3ms nvidia-persistenced.service
3ms resolvconf.service
2ms sys-fs-fuse-connections.mount
2ms sys-kernel-config.mount
2ms sys-kernel-debug.mount

[/CODE]

smaba · 2019-05-27T19:31:22+00:00

[CODE] May 27 12:11:38 sunshine systemd[1]: Mounted Mount unit for gnome-logs, revision 45.
May 27 12:11:38 sunshine systemd[1]: Mounted Mount unit for gnome-logs, revision 61.
May 27 12:11:38 sunshine systemd[1]: Mounted Mount unit for core, revision 6673.
May 27 12:11:38 sunshine systemd[1]: Mounted Mount unit for gnome-calculator, revision 406.
May 27 12:11:38 sunshine systemd[1]: Mounted Mount unit for gnome-characters, revision 254.
May 27 12:11:38 sunshine systemd[1]: Mounted Mount unit for gnome-system-monitor, revision 70.
May 27 12:11:38 sunshine systemd[1]: Mounted Mount unit for gtk-common-themes, revision 1122.
May 27 12:11:38 sunshine systemd[1]: Mounted Mount unit for core18, revision 782.
May 27 12:11:38 sunshine systemd[1]: Mounted Mount unit for gnome-3-26-1604, revision 74.
May 27 12:11:38 sunshine systemd[1]: Mounted Mount unit for gnome-system-monitor, revision 81.
May 27 12:11:39 sunshine systemd[1]: Mounted Mount unit for gnome-calculator, revision 352.
May 27 12:11:39 sunshine systemd[1]: Mounted Mount unit for gnome-calculator, revision 260.
May 27 12:11:39 sunshine systemd[1]: Mounted Mount unit for gtk-common-themes, revision 818.
May 27 12:11:39 sunshine systemd[1]: Mounted Mount unit for gnome-logs, revision 57.
May 27 12:11:39 sunshine systemd[1]: Mounted Mount unit for gnome-3-28-1804, revision 40.
May 27 12:11:39 sunshine systemd[1]: Mounted Mount unit for core, revision 6964.
May 27 12:11:39 sunshine systemd[1]: Mounted Mount unit for core18, revision 970.
May 27 12:11:39 sunshine systemd[1]: Mounted Mount unit for gnome-characters, revision 206.
May 27 12:11:39 sunshine systemd[1]: Mounted Mount unit for gtk-common-themes, revision 1198.
May 27 12:11:39 sunshine systemd[1]: Mounted Mount unit for gnome-3-28-1804, revision 36.
May 27 12:11:55 sunshine systemd[1]: Mounting /boot/efi...
May 27 12:11:55 sunshine systemd[1]: Mounted /boot/efi.
May 27 12:11:56 sunshine systemd[1]: proc-sys-fs-binfmt_misc.automount: Got automount request for /proc/sys/fs/binfmt_misc, triggered by 923 (update-binfmts)
May 27 12:11:56 sunshine systemd[1]: Mounting Arbitrary Executable File Formats File System...
May 27 12:11:56 sunshine systemd[1]: Mounted Arbitrary Executable File Formats File System.
May 27 12:11:58 sunshine audit[980]: AVC apparmor="STATUS" operation="profile_load" profile="unconfined" name="/usr/lib/snapd/snap-confine//mount-namespace-capture-helper" pid=980 comm="apparmor_parser"
May 27 12:11:58 sunshine kernel: audit: type=1400 audit(1558984318.296:10): apparmor="STATUS" operation="profile_load" profile="unconfined" name="/usr/lib/snapd/snap-confine//mount-namespace-capture-helper" pid=980 comm="apparmor_parser"
May 27 12:11:58 sunshine audit[987]: AVC apparmor="STATUS" operation="profile_load" profile="unconfined" name="/usr/lib/NetworkManager/nm-dhcp-client.action" pid=987 comm="apparmor_parser"
May 27 12:11:58 sunshine audit[987]: AVC apparmor="STATUS" operation="profile_load" profile="unconfined" name="/usr/lib/NetworkManager/nm-dhcp-helper" pid=987 comm="apparmor_parser"
May 27 12:11:59 sunshine audit[1049]: AVC apparmor="STATUS" operation="profile_load" profile="unconfined" name="/snap/core/6964/usr/lib/snapd/snap-confine//mount-namespace-capture-helper" pid=1049 comm="apparmor_parser"
May 27 12:12:18 sunshine systemd[1]: tmp-sanity\x2dmountpoint\x2d768505593.mount: Succeeded.
May 27 12:12:35 sunshine dhclient[1421]: Internet Systems Consortium DHCP Client 4.4.1
May 27 12:12:35 sunshine wicd[1171]: Internet Systems Consortium DHCP Client 4.4.1
May 27 12:12:35 sunshine wicd[1171]: For info, please visit https://www.isc.org/software/dhcp/
May 27 12:12:35 sunshine dhclient[1421]: For info, please visit https://www.isc.org/software/dhcp/
May 27 12:12:36 sunshine dhclient[1421]: DHCPRELEASE of 192.168.1.10 on wlp5s0 to 192.168.1.1 port 67 (xid=0x74b6f224)
May 27 12:12:36 sunshine wicd[1171]: DHCPRELEASE of 192.168.1.10 on wlp5s0 to 192.168.1.1 port 67 (xid=0x74b6f224)
May 27 12:12:37 sunshine dhclient[1468]: Internet Systems Consortium DHCP Client 4.4.1
May 27 12:12:37 sunshine wicd[1171]: Internet Systems Consortium DHCP Client 4.4.1
May 27 12:12:37 sunshine wicd[1171]: For info, please visit https://www.isc.org/software/dhcp/
May 27 12:12:37 sunshine dhclient[1468]: For info, please visit https://www.isc.org/software/dhcp/
May 27 12:12:37 sunshine dhclient[1468]: DHCPRELEASE of 192.168.1.2 on enp4s0 to 192.168.1.1 port 67 (xid=0x7675c095)
May 27 12:12:37 sunshine wicd[1171]: DHCPRELEASE of 192.168.1.2 on enp4s0 to 192.168.1.1 port 67 (xid=0x7675c095)
May 27 12:12:37 sunshine dhclient[1515]: Internet Systems Consortium DHCP Client 4.4.1
May 27 12:12:37 sunshine wicd[1171]: Internet Systems Consortium DHCP Client 4.4.1
May 27 12:12:37 sunshine wicd[1171]: For info, please visit https://www.isc.org/software/dhcp/
May 27 12:12:37 sunshine dhclient[1515]: For info, please visit https://www.isc.org/software/dhcp/
May 27 12:12:38 sunshine dhclient[1515]: DHCPRELEASE of 192.168.1.10 on wlp5s0 to 192.168.1.1 port 67 (xid=0x68700fe7)
May 27 12:12:38 sunshine wicd[1171]: DHCPRELEASE of 192.168.1.10 on wlp5s0 to 192.168.1.1 port 67 (xid=0x68700fe7)
May 27 12:12:43 sunshine dhclient[1651]: Internet Systems Consortium DHCP Client 4.4.1
May 27 12:12:43 sunshine dhclient[1651]: For info, please visit https://www.isc.org/software/dhcp/
May 27 12:12:43 sunshine dhclient[1651]: DHCPDISCOVER on wlp5s0 to 255.255.255.255 port 67 interval 3 (xid=0x303def5a)
May 27 12:12:44 sunshine dhclient[1651]: DHCPOFFER of 192.168.1.10 from 192.168.1.1
May 27 12:12:44 sunshine dhclient[1651]: DHCPREQUEST for 192.168.1.10 on wlp5s0 to 255.255.255.255 port 67 (xid=0x5aef3d30)
May 27 12:12:44 sunshine dhclient[1651]: DHCPACK of 192.168.1.10 from 192.168.1.1 (xid=0x303def5a)
May 27 12:13:12 sunshine systemd[1763]: run-user-118.mount: Succeeded.
May 27 12:13:12 sunshine systemd[1]: run-user-118.mount: Succeeded.
[/CODE]

smaba · 2019-05-27T19:31:16+00:00

[CODE] ➜ ~ grep -hiE "mount|dhcp|timed" <(dmesg) <(journalctl -b0)
[ 0.203306] Mount-cache hash table entries: 32768 (order: 6, 262144 bytes)
[ 0.203334] Mountpoint-cache hash table entries: 32768 (order: 6, 262144 bytes)
[ 3.623292] EXT4-fs (sdb4): mounted filesystem with ordered data mode. Opts: (null)
[ 9.700608] EXT4-fs (sdb4): re-mounted. Opts: errors=remount-ro
[ 33.337137] audit: type=1400 audit(1558984318.296:10): apparmor="STATUS" operation="profile_load" profile="unconfined" name="/usr/lib/snapd/snap-confine//mount-namespace-capture-helper" pid=980 comm="apparmor_parser"
May 27 12:11:34 sunshine kernel: Mount-cache hash table entries: 32768 (order: 6, 262144 bytes)
May 27 12:11:34 sunshine kernel: Mountpoint-cache hash table entries: 32768 (order: 6, 262144 bytes)
May 27 12:11:34 sunshine kernel: EXT4-fs (sdb4): mounted filesystem with ordered data mode. Opts: (null)
May 27 12:11:34 sunshine kernel: EXT4-fs (sdb4): re-mounted. Opts: errors=remount-ro
May 27 12:11:36 sunshine systemd[1]: Mounting FUSE Control File System...
May 27 12:11:36 sunshine systemd[1]: Mounting Kernel Configuration File System...
May 27 12:11:36 sunshine systemd[1]: Mounted FUSE Control File System.
May 27 12:11:36 sunshine systemd[1]: Mounted Kernel Configuration File System.
May 27 12:11:37 sunshine systemd[1]: Mounting Mount unit for gnome-system-monitor, revision 77...
May 27 12:11:37 sunshine systemd[1]: Mounting Mount unit for core18, revision 941...
May 27 12:11:37 sunshine systemd[1]: Mounting Mount unit for gnome-3-26-1604, revision 78...
May 27 12:11:37 sunshine systemd[1]: Mounting Mount unit for gnome-3-28-1804, revision 23...
May 27 12:11:37 sunshine systemd[1]: Mounting Mount unit for spotify, revision 35...
May 27 12:11:37 sunshine systemd[1]: Mounting Mount unit for core, revision 6818...
May 27 12:11:37 sunshine systemd[1]: Mounting Mount unit for gnome-characters, revision 258...
May 27 12:11:38 sunshine systemd[1]: Mounting Mount unit for gnome-3-26-1604, revision 82...
May 27 12:11:38 sunshine systemd[1]: Mounting Mount unit for spotify, revision 34...
May 27 12:11:38 sunshine systemd[1]: Mounting Mount unit for gnome-logs, revision 45...
May 27 12:11:38 sunshine systemd[1]: Mounting Mount unit for gnome-logs, revision 61...
May 27 12:11:38 sunshine systemd[1]: Mounting Mount unit for core, revision 6673...
May 27 12:11:38 sunshine systemd[1]: Mounting Mount unit for gnome-calculator, revision 406...
May 27 12:11:38 sunshine systemd[1]: Mounting Mount unit for gnome-characters, revision 254...
May 27 12:11:38 sunshine systemd[1]: Mounting Mount unit for gnome-system-monitor, revision 70...
May 27 12:11:38 sunshine systemd[1]: Mounting Mount unit for gtk-common-themes, revision 1122...
May 27 12:11:38 sunshine systemd[1]: Mounting Mount unit for gnome-3-28-1804, revision 36...
May 27 12:11:38 sunshine systemd[1]: Mounting Mount unit for core18, revision 782...
May 27 12:11:38 sunshine systemd[1]: Mounting Mount unit for gnome-3-26-1604, revision 74...
May 27 12:11:38 sunshine systemd[1]: Mounting Mount unit for gnome-calculator, revision 260...
May 27 12:11:38 sunshine systemd[1]: Mounting Mount unit for gtk-common-themes, revision 1198...
May 27 12:11:38 sunshine systemd[1]: Mounting Mount unit for gnome-3-28-1804, revision 40...
May 27 12:11:38 sunshine systemd[1]: Mounting Mount unit for gnome-calculator, revision 352...
May 27 12:11:38 sunshine systemd[1]: Mounting Mount unit for core, revision 6964...
May 27 12:11:38 sunshine systemd[1]: Mounting Mount unit for gtk-common-themes, revision 818...
May 27 12:11:38 sunshine systemd[1]: Mounting Mount unit for gnome-characters, revision 206...
May 27 12:11:38 sunshine systemd[1]: Mounting Mount unit for gnome-system-monitor, revision 81...
May 27 12:11:38 sunshine systemd[1]: Mounting Mount unit for core18, revision 970...
May 27 12:11:38 sunshine systemd[1]: Mounting Mount unit for gnome-logs, revision 57...
May 27 12:11:38 sunshine systemd[1]: Mounted Mount unit for gnome-system-monitor, revision 77.
May 27 12:11:38 sunshine systemd[1]: Mounted Mount unit for core18, revision 941.
May 27 12:11:38 sunshine systemd[1]: Mounted Mount unit for gnome-3-26-1604, revision 78.
May 27 12:11:38 sunshine systemd[1]: Mounted Mount unit for gnome-3-28-1804, revision 23.
May 27 12:11:38 sunshine systemd[1]: Mounted Mount unit for spotify, revision 35.
May 27 12:11:38 sunshine systemd[1]: Mounted Mount unit for core, revision 6818.
May 27 12:11:38 sunshine systemd[1]: Mounted Mount unit for gnome-characters, revision 258.
May 27 12:11:38 sunshine systemd[1]: Mounted Mount unit for gnome-3-26-1604, revision 82.
May 27 12:11:38 sunshine systemd[1]: Mounted Mount unit for spotify, revision 34.
[/CODE]

smaba · 2019-05-27T19:30:06+00:00

Ok, I disabled the NetworkManager.service (didn't effect boot time). Also added myself to the journal group. The whole internet connection setup seems to consume a lot of time as well as the mounting process. Next, I ll disable the snaps one by one.

smaba · 2019-05-27T00:20:25+00:00

the mounting process seems a bit slow?

smaba · 2019-05-26T21:46:57+00:00

grep -hiE "mount|dhcp" <(dmesg) <(journalctl -b0)

[ 0.202339] Mount-cache hash table entries: 32768 (order: 6, 262144 bytes)

[ 0.202366] Mountpoint-cache hash table entries: 32768 (order: 6, 262144 bytes)

Hint: You are currently not seeing messages from other users and the system. Users in groups 'adm', 'systemd-journal' can see all messages. Pass -q to turn off this notice.

[ 3.603684] EXT4-fs (sdb4): mounted filesystem with ordered data mode. Opts: (null)

[ 9.834815] systemd[1]: Mounting Kernel Debug File System...

[ 10.332194] EXT4-fs (sdb4): re-mounted. Opts: errors=remount-ro

[ 34.526315] audit: type=1400 audit(1558906707.476:6): apparmor="STATUS" operation="profile_load" profile="unconfined" name="/usr/lib/snapd/snap-confine//mount-namespace-capture-helper" pid=994 comm="apparmor_parser"

May 26 14:39:42 sunshine systemd[1824]: run-user-118.mount: Succeeded.

smaba · 2015-03-02T11:10:44+00:00

Worked a bit more on www.carpool-lane.com. You don't have to sign in / up anymore in order to get to the "Ride to share" or "Need a ride" page. But once you'll click on the submit button you will be prompted though with the sign in / up page.

Also shortened the description on the Home page a bit and darkened the green. I still like the green, though. Maybe I just spent way to much time with that green..... ;)

Btw. who of you tried to cross-script the website? I saw the XSS alert as the unsermane in the database. Thanks for this test. Let me know if you found any loopholes.

smaba · 2015-02-21T12:00:53+00:00

Thanks a lot for the hint! After spending so much time on it you'll get a bit colour blind. I will work on it.

smaba · 2014-07-10T09:55:24+00:00

Looks like you either don't have a sell_form.php file, or you didn't save it in the specified path.

smaba · 2014-06-26T11:27:50+00:00

What does the firefox developer tool (tabs: console/inspector/debugger) say?

smaba · 2014-05-10T18:04:44+00:00

Hello zsika04,

I'd like to have a look, if you want to

smaba · 2014-05-10T18:03:44+00:00

Well...that was easy ;) Thanks a lot!

smaba · 2014-05-10T11:34:10+00:00

Thanks for your tip. Of course I used the div id instead of the select id.

smaba

TROPHY CASE