dhcpcd-discuss

Re: Tentative global IPv6 addresses with 8.1.4

Nico Schottelius

Sun Dec 29 11:43:12 2019

Good morning,

just a heads up - I'm seeing similar issues here at the 36c3, kernel
version 5.4.6-arch3-1 and dhcpcd 8.1.4-1.

Also staying in tentative state:

2: wlp0s20f3: <BROADCAST,MULTICAST,UP,LOWER_UP> mtu 1500 qdisc noqueue state UP group default qlen 1000
    link/ether 24:ee:9a:54:c3:bf brd ff:ff:ff:ff:ff:ff
    inet 151.217.198.178/18 brd 151.217.255.255 scope global dynamic noprefixroute wlp0s20f3
       valid_lft 2448sec preferred_lft 2080sec
    inet6 2001:67c:20a1:1192:2771:be04:4d42:d834/64 scope global tentative dynamic mngtmpaddr noprefixroute
       valid_lft 7106sec preferred_lft 3506sec
    inet6 fe80::5d65:bdcf:7387:86cf/64 scope link
       valid_lft forever preferred_lft forever

Let me know if additional logs can help to follow up here or at the
LKML.

Best regards,

Nico


Steve Hirsch <stevehirsch49@xxxxxxx> writes:

> I’ve included logs for both versions 8.1.2 and 8.1.4 running on the same
> Arch Linux server with kernel 5.4.6.  The IPv6 tentative problem is not
> isolated to only this server, but appears on 2 other servers when running
> 8.1.4.
>
> Note: waitip.sh is a bash script that runs from dhcpcd@br0.service
> after executing dhcpcd and is a simple loop waiting for IP addresses
> instead of using waitip in dhdcpd.conf.  You'll see a timeout for
> waitip.sh in the 8.1.4 log as it is waiting for a non-tentative IPv6
> address.
>
> -- Logs begin at Thu 2019-12-26 13:04:33 MST, end at Sat 2019-12-28 08:26:51 MST. --
> Dec 28 08:03:46 server01 systemd[1]: Starting dhcpcd on br0...
> Dec 28 08:03:46 server01 dhcpcd[456]: dhcpcd-8.1.2 starting
> Dec 28 08:03:46 server01 dhcpcd[456]: dhcpcd-8.1.2 starting
> Dec 28 08:03:46 server01 dhcpcd[456]: br0: executing `/usr/lib/dhcpcd/dhcpcd-run-hooks' PREINIT
> Dec 28 08:03:46 server01 dhcpcd[456]: br0: executing `/usr/lib/dhcpcd/dhcpcd-run-hooks' PREINIT
> Dec 28 08:03:46 server01 dhcpcd[456]: br0: executing `/usr/lib/dhcpcd/dhcpcd-run-hooks' CARRIER
> Dec 28 08:03:46 server01 dhcpcd[456]: br0: executing `/usr/lib/dhcpcd/dhcpcd-run-hooks' CARRIER
> Dec 28 08:03:46 server01 dhcpcd[456]: DUID 00:04:03:00:02:00:04:00:05:00:00:06:00:07:00:08:00:09
> Dec 28 08:03:46 server01 dhcpcd[456]: br0: IAID xx:xx:a1:ca
> Dec 28 08:03:46 server01 dhcpcd[456]: br0: adding address fe80::xxxx:xxxx:xxxx:a1ca
> Dec 28 08:03:46 server01 dhcpcd[456]: br0: pltime infinity, vltime infinity
> Dec 28 08:03:46 server01 dhcpcd[456]: DUID 00:04:03:00:02:00:04:00:05:00:00:06:00:07:00:08:00:09
> Dec 28 08:03:46 server01 dhcpcd[456]: br0: delaying IPv6 router solicitation for 0.8 seconds
> Dec 28 08:03:46 server01 dhcpcd[456]: br0: delaying IPv4 for 0.8 seconds
> Dec 28 08:03:46 server01 dhcpcd[456]: br0: IAID xx:xx:a1:ca
> Dec 28 08:03:46 server01 dhcpcd[456]: br0: adding address fe80::xxxx:xxxx:xxxx:a1ca
> Dec 28 08:03:46 server01 dhcpcd[456]: br0: pltime infinity, vltime infinity
> Dec 28 08:03:46 server01 dhcpcd[456]: br0: delaying IPv6 router solicitation for 0.8 seconds
> Dec 28 08:03:46 server01 dhcpcd[456]: br0: delaying IPv4 for 0.8 seconds
> Dec 28 08:03:46 server01 dhcpcd[456]: br0: carrier lost
> Dec 28 08:03:46 server01 dhcpcd[456]: br0: executing `/usr/lib/dhcpcd/dhcpcd-run-hooks' NOCARRIER
> Dec 28 08:03:46 server01 dhcpcd[456]: br0: carrier lost
> Dec 28 08:03:46 server01 dhcpcd[456]: br0: executing `/usr/lib/dhcpcd/dhcpcd-run-hooks' NOCARRIER
> Dec 28 08:03:46 server01 dhcpcd[456]: br0: deleting address fe80::xxxx:xxxx:xxxx:a1ca
> Dec 28 08:03:46 server01 dhcpcd[456]: br0: deleting address fe80::xxxx:xxxx:xxxx:a1ca
> Dec 28 08:03:50 server01 dhcpcd[456]: br0: carrier acquired
> Dec 28 08:03:50 server01 dhcpcd[456]: br0: carrier acquired
> Dec 28 08:03:50 server01 dhcpcd[456]: br0: executing `/usr/lib/dhcpcd/dhcpcd-run-hooks' CARRIER
> Dec 28 08:03:50 server01 dhcpcd[456]: br0: executing `/usr/lib/dhcpcd/dhcpcd-run-hooks' CARRIER
> Dec 28 08:03:50 server01 dhcpcd[456]: br0: IAID xx:xx:a1:ca
> Dec 28 08:03:50 server01 dhcpcd[456]: br0: adding address fe80::xxxx:xxxx:xxxx:a1ca
> Dec 28 08:03:50 server01 dhcpcd[456]: br0: pltime infinity, vltime infinity
> Dec 28 08:03:50 server01 dhcpcd[456]: br0: IAID xx:xx:a1:ca
> Dec 28 08:03:50 server01 dhcpcd[456]: br0: delaying IPv6 router solicitation for 0.3 seconds
> Dec 28 08:03:50 server01 dhcpcd[456]: br0: delaying IPv4 for 0.9 seconds
> Dec 28 08:03:50 server01 dhcpcd[456]: br0: adding address fe80::xxxx:xxxx:xxxx:a1ca
> Dec 28 08:03:50 server01 dhcpcd[456]: br0: pltime infinity, vltime infinity
> Dec 28 08:03:50 server01 dhcpcd[456]: br0: delaying IPv6 router solicitation for 0.3 seconds
> Dec 28 08:03:50 server01 dhcpcd[456]: br0: delaying IPv4 for 0.9 seconds
> Dec 28 08:03:50 server01 dhcpcd[456]: br0: soliciting an IPv6 router
> Dec 28 08:03:50 server01 dhcpcd[456]: br0: delaying Router Solicitation for LL address
> Dec 28 08:03:50 server01 dhcpcd[456]: br0: soliciting an IPv6 router
> Dec 28 08:03:50 server01 dhcpcd[456]: br0: delaying Router Solicitation for LL address
> Dec 28 08:03:51 server01 dhcpcd[456]: br0: reading lease `/var/lib/dhcpcd/br0.lease'
> Dec 28 08:03:51 server01 dhcpcd[456]: br0: reading lease `/var/lib/dhcpcd/br0.lease'
> Dec 28 08:03:51 server01 dhcpcd[456]: br0: rebinding lease of 192.168.14.10
> Dec 28 08:03:51 server01 dhcpcd[456]: br0: sending REQUEST (xid 0xc2a190a4), next in 3.8 seconds
> Dec 28 08:03:51 server01 dhcpcd[456]: br0: rebinding lease of 192.168.14.10
> Dec 28 08:03:51 server01 dhcpcd[456]: br0: sending REQUEST (xid 0xc2a190a4), next in 3.8 seconds
> Dec 28 08:03:51 server01 dhcpcd[456]: br0: acknowledged 192.168.14.10 from 192.168.14.1
> Dec 28 08:03:51 server01 dhcpcd[456]: br0: leased 192.168.14.10 for 86400 seconds
> Dec 28 08:03:51 server01 dhcpcd[456]: br0: renew in 43200 seconds, rebind in 75600 seconds
> Dec 28 08:03:51 server01 dhcpcd[456]: br0: acknowledged 192.168.14.10 from 192.168.14.1
> Dec 28 08:03:51 server01 dhcpcd[456]: br0: writing lease `/var/lib/dhcpcd/br0.lease'
> Dec 28 08:03:51 server01 dhcpcd[456]: br0: leased 192.168.14.10 for 86400 seconds
> Dec 28 08:03:51 server01 dhcpcd[456]: br0: renew in 43200 seconds, rebind in 75600 seconds
> Dec 28 08:03:51 server01 dhcpcd[456]: br0: adding IP address 192.168.14.10/24 broadcast 192.168.14.255
> Dec 28 08:03:51 server01 dhcpcd[456]: br0: writing lease `/var/lib/dhcpcd/br0.lease'
> Dec 28 08:03:51 server01 dhcpcd[456]: br0: adding IP address 192.168.14.10/24 broadcast 192.168.14.255
> Dec 28 08:03:51 server01 dhcpcd[456]: br0: adding route to 192.168.14.0/24
> Dec 28 08:03:51 server01 dhcpcd[456]: br0: adding default route via 192.168.14.1
> Dec 28 08:03:51 server01 dhcpcd[456]: br0: adding route to 192.168.14.0/24
> Dec 28 08:03:51 server01 dhcpcd[456]: br0: adding default route via 192.168.14.1
> Dec 28 08:03:51 server01 dhcpcd[456]: br0: ARP announcing 192.168.14.10 (1 of 2), next in 2.0 seconds
> Dec 28 08:03:51 server01 dhcpcd[456]: br0: ARP announcing 192.168.14.10 (1 of 2), next in 2.0 seconds
> Dec 28 08:03:51 server01 dhcpcd[456]: br0: executing `/usr/lib/dhcpcd/dhcpcd-run-hooks' REBOOT
> Dec 28 08:03:51 server01 dhcpcd[456]: br0: executing `/usr/lib/dhcpcd/dhcpcd-run-hooks' REBOOT
> Dec 28 08:03:51 server01 dhcpcd[456]: forking to background
> Dec 28 08:03:51 server01 dhcpcd[456]: forking to background
> Dec 28 08:03:51 server01 dhcpcd[456]: forked to background, child pid 502
> Dec 28 08:03:51 server01 dhcpcd[456]: forked to background, child pid 502
> Dec 28 08:03:51 server01 waitip.sh[503]: waitip starting on br0
> Dec 28 08:03:51 server01 waitip.sh[503]: waitip waiting for ipv4 on br0
> Dec 28 08:03:51 server01 waitip.sh[503]: waitip waiting for ipv6 on br0
> Dec 28 08:03:52 server01 dhcpcd[502]: br0: sending Router Solicitation
> Dec 28 08:03:52 server01 dhcpcd[502]: br0: Router Advertisement from fe80::xxxx:xxxx:xxxx:802d
> Dec 28 08:03:52 server01 dhcpcd[502]: br0: adding route to 26xx:xxx:xxxx:xxxx::/64
> Dec 28 08:03:52 server01 dhcpcd[502]: br0: adding default route via fe80::xxxx:xxxx:xxxx:802d
> Dec 28 08:03:52 server01 dhcpcd[502]: br0: executing `/usr/lib/dhcpcd/dhcpcd-run-hooks' ROUTERADVERT
> Dec 28 08:03:52 server01 dhcpcd[502]: br0: reading lease `/var/lib/dhcpcd/br0.lease6'
> Dec 28 08:03:52 server01 dhcpcd[502]: br0: confirming prior DHCPv6 lease
> Dec 28 08:03:52 server01 dhcpcd[502]: br0: delaying CONFIRM6 (xid 0xe4a674), next in 0.8 seconds
> Dec 28 08:03:52 server01 dhcpcd[502]: br0: fe80::xxxx:xxxx:xxxx:802d is reachable again
> Dec 28 08:03:52 server01 dhcpcd[502]: br0: broadcasting CONFIRM6 (xid 0xe4a674), next in 1.0 seconds
> Dec 28 08:03:52 server01 dhcpcd[502]: br0: REPLY6 received from fe80::xxxx:xxxx:xxxx:802d
> Dec 28 08:03:52 server01 dhcpcd[502]: br0: adding address 26xx:xxx:xxxx:xxxx::10/128
> Dec 28 08:03:52 server01 dhcpcd[502]: br0: pltime 86400 seconds, vltime 86400 seconds
> Dec 28 08:03:52 server01 dhcpcd[502]: br0: renew in 40085, rebind in 72485, expire in 86400 seconds
> Dec 28 08:03:52 server01 dhcpcd[502]: br0: writing lease `/var/lib/dhcpcd/br0.lease6'
> Dec 28 08:03:52 server01 dhcpcd[502]: br0: waiting for DHCPv6 DAD to complete
> Dec 28 08:03:53 server01 dhcpcd[502]: br0: ARP announcing 192.168.14.10 (2 of 2)
> Dec 28 08:03:56 server01 dhcpcd[502]: br0: DHCPv6 DAD completed
> Dec 28 08:03:56 server01 dhcpcd[502]: br0: executing `/usr/lib/dhcpcd/dhcpcd-run-hooks' REBOOT6
> Dec 28 08:03:56 server01 dhcpcd[502]: br0: sending NA for 26xx:xxx:xxxx:xxxx::10/128
> Dec 28 08:03:57 server01 waitip.sh[503]: waitip finished on br0
> Dec 28 08:03:57 server01 systemd[1]: Started dhcpcd on br0.
> Dec 28 08:03:57 server01 dhcpcd[502]: br0: sending NA for 26xx:xxx:xxxx:xxxx::10/128
> Dec 28 08:03:58 server01 dhcpcd[502]: br0: sending NA for 26xx:xxx:xxxx:xxxx::10/128
> Dec 28 08:04:02 server01 dhcpcd[502]: br0: fe80::xxxx:xxxx:xxxx:802d is reachable again
> Dec 28 08:04:02 server01 dhcpcd[502]: br0: fe80::xxxx:xxxx:xxxx:802d is reachable again
> Dec 28 08:05:15 server01 systemd[1]: Stopping dhcpcd on br0...
> Dec 28 08:05:15 server01 dhcpcd[894]: sending signal TERM to pid 502
> Dec 28 08:05:15 server01 dhcpcd[894]: waiting for pid 502 to exit
> Dec 28 08:05:15 server01 dhcpcd[894]: sending signal TERM to pid 502
> Dec 28 08:05:15 server01 dhcpcd[894]: waiting for pid 502 to exit
> Dec 28 08:05:15 server01 dhcpcd[502]: received SIGTERM, stopping
> Dec 28 08:05:15 server01 dhcpcd[502]: br0: removing interface
> Dec 28 08:05:15 server01 dhcpcd[502]: br0: executing `/usr/lib/dhcpcd/dhcpcd-run-hooks' STOPPED
> Dec 28 08:05:15 server01 dhcpcd[502]: dhcpcd exited
> Dec 28 08:05:15 server01 systemd[1]: dhcpcd@br0.service: Succeeded.
> Dec 28 08:05:15 server01 systemd[1]: Stopped dhcpcd on br0.
>
> -- Logs begin at Thu 2019-12-26 13:04:33 MST, end at Sat 2019-12-28 08:26:51 MST. --
> Dec 28 08:05:30 server01 systemd[1]: Starting dhcpcd on br0...
> Dec 28 08:05:30 server01 dhcpcd[462]: dhcpcd-8.1.4 starting
> Dec 28 08:05:30 server01 dhcpcd[462]: dhcpcd-8.1.4 starting
> Dec 28 08:05:30 server01 dhcpcd[462]: br0: executing `/usr/lib/dhcpcd/dhcpcd-run-hooks' PREINIT
> Dec 28 08:05:30 server01 dhcpcd[462]: br0: executing `/usr/lib/dhcpcd/dhcpcd-run-hooks' PREINIT
> Dec 28 08:05:30 server01 dhcpcd[462]: br0: executing `/usr/lib/dhcpcd/dhcpcd-run-hooks' CARRIER
> Dec 28 08:05:30 server01 dhcpcd[462]: br0: executing `/usr/lib/dhcpcd/dhcpcd-run-hooks' CARRIER
> Dec 28 08:05:30 server01 dhcpcd[462]: DUID 00:04:03:00:02:00:04:00:05:00:00:06:00:07:00:08:00:09
> Dec 28 08:05:30 server01 dhcpcd[462]: br0: IAID xx:xx:a1:ca
> Dec 28 08:05:30 server01 dhcpcd[462]: br0: adding address fe80::xxxx:xxxx:xxxx:a1ca
> Dec 28 08:05:30 server01 dhcpcd[462]: br0: pltime infinity, vltime infinity
> Dec 28 08:05:30 server01 dhcpcd[462]: br0: delaying IPv6 router solicitation for 0.8 seconds
> Dec 28 08:05:30 server01 dhcpcd[462]: br0: delaying IPv4 for 0.2 seconds
> Dec 28 08:05:30 server01 dhcpcd[462]: DUID 00:04:03:00:02:00:04:00:05:00:00:06:00:07:00:08:00:09
> Dec 28 08:05:30 server01 dhcpcd[462]: br0: IAID xx:xx:a1:ca
> Dec 28 08:05:30 server01 dhcpcd[462]: br0: adding address fe80::xxxx:xxxx:xxxx:a1ca
> Dec 28 08:05:30 server01 dhcpcd[462]: br0: pltime infinity, vltime infinity
> Dec 28 08:05:30 server01 dhcpcd[462]: br0: delaying IPv6 router solicitation for 0.8 seconds
> Dec 28 08:05:30 server01 dhcpcd[462]: br0: delaying IPv4 for 0.2 seconds
> Dec 28 08:05:30 server01 dhcpcd[462]: br0: reading lease `/var/lib/dhcpcd/br0.lease'
> Dec 28 08:05:30 server01 dhcpcd[462]: br0: reading lease `/var/lib/dhcpcd/br0.lease'
> Dec 28 08:05:30 server01 dhcpcd[462]: br0: rebinding lease of 192.168.14.10
> Dec 28 08:05:30 server01 dhcpcd[462]: br0: sending REQUEST (xid 0xf649b726), next in 4.8 seconds
> Dec 28 08:05:30 server01 dhcpcd[462]: br0: rebinding lease of 192.168.14.10
> Dec 28 08:05:30 server01 dhcpcd[462]: br0: sending REQUEST (xid 0xf649b726), next in 4.8 seconds
> Dec 28 08:05:30 server01 dhcpcd[462]: br0: carrier lost
> Dec 28 08:05:30 server01 dhcpcd[462]: br0: executing `/usr/lib/dhcpcd/dhcpcd-run-hooks' NOCARRIER
> Dec 28 08:05:30 server01 dhcpcd[462]: br0: carrier lost
> Dec 28 08:05:30 server01 dhcpcd[462]: br0: executing `/usr/lib/dhcpcd/dhcpcd-run-hooks' NOCARRIER
> Dec 28 08:05:30 server01 dhcpcd[462]: br0: deleting address fe80::xxxx:xxxx:xxxx:a1ca
> Dec 28 08:05:30 server01 dhcpcd[462]: br0: executing `/usr/lib/dhcpcd/dhcpcd-run-hooks' EXPIRE
> Dec 28 08:05:30 server01 dhcpcd[462]: br0: deleting address fe80::xxxx:xxxx:xxxx:a1ca
> Dec 28 08:05:30 server01 dhcpcd[462]: br0: executing `/usr/lib/dhcpcd/dhcpcd-run-hooks' EXPIRE
> Dec 28 08:05:34 server01 dhcpcd[462]: br0: carrier acquired
> Dec 28 08:05:34 server01 dhcpcd[462]: br0: carrier acquired
> Dec 28 08:05:34 server01 dhcpcd[462]: br0: executing `/usr/lib/dhcpcd/dhcpcd-run-hooks' CARRIER
> Dec 28 08:05:34 server01 dhcpcd[462]: br0: executing `/usr/lib/dhcpcd/dhcpcd-run-hooks' CARRIER
> Dec 28 08:05:34 server01 dhcpcd[462]: br0: IAID xx:xx:a1:ca
> Dec 28 08:05:34 server01 dhcpcd[462]: br0: adding address fe80::xxxx:xxxx:xxxx:a1ca
> Dec 28 08:05:34 server01 dhcpcd[462]: br0: pltime infinity, vltime infinity
> Dec 28 08:05:34 server01 dhcpcd[462]: br0: IAID xx:xx:a1:ca
> Dec 28 08:05:34 server01 dhcpcd[462]: br0: delaying IPv6 router solicitation for 0.3 seconds
> Dec 28 08:05:34 server01 dhcpcd[462]: br0: delaying IPv4 for 0.2 seconds
> Dec 28 08:05:34 server01 dhcpcd[462]: br0: adding address fe80::xxxx:xxxx:xxxx:a1ca
> Dec 28 08:05:34 server01 dhcpcd[462]: br0: pltime infinity, vltime infinity
> Dec 28 08:05:34 server01 dhcpcd[462]: br0: delaying IPv6 router solicitation for 0.3 seconds
> Dec 28 08:05:34 server01 dhcpcd[462]: br0: delaying IPv4 for 0.2 seconds
> Dec 28 08:05:34 server01 dhcpcd[462]: br0: reading lease `/var/lib/dhcpcd/br0.lease'
> Dec 28 08:05:34 server01 dhcpcd[462]: br0: rebinding lease of 192.168.14.10
> Dec 28 08:05:34 server01 dhcpcd[462]: br0: reading lease `/var/lib/dhcpcd/br0.lease'
> Dec 28 08:05:34 server01 dhcpcd[462]: br0: sending REQUEST (xid 0x744adbd0), next in 3.8 seconds
> Dec 28 08:05:34 server01 dhcpcd[462]: br0: rebinding lease of 192.168.14.10
> Dec 28 08:05:34 server01 dhcpcd[462]: br0: sending REQUEST (xid 0x744adbd0), next in 3.8 seconds
> Dec 28 08:05:34 server01 dhcpcd[462]: br0: acknowledged 192.168.14.10 from 192.168.14.1
> Dec 28 08:05:34 server01 dhcpcd[462]: br0: leased 192.168.14.10 for 86400 seconds
> Dec 28 08:05:34 server01 dhcpcd[462]: br0: renew in 43200 seconds, rebind in 75600 seconds
> Dec 28 08:05:34 server01 dhcpcd[462]: br0: writing lease `/var/lib/dhcpcd/br0.lease'
> Dec 28 08:05:34 server01 dhcpcd[462]: br0: acknowledged 192.168.14.10 from 192.168.14.1
> Dec 28 08:05:34 server01 dhcpcd[462]: br0: adding IP address 192.168.14.10/24 broadcast 192.168.14.255
> Dec 28 08:05:34 server01 dhcpcd[462]: br0: adding route to 192.168.14.0/24
> Dec 28 08:05:34 server01 dhcpcd[462]: br0: leased 192.168.14.10 for 86400 seconds
> Dec 28 08:05:34 server01 dhcpcd[462]: br0: adding default route via 192.168.14.1
> Dec 28 08:05:34 server01 dhcpcd[462]: br0: renew in 43200 seconds, rebind in 75600 seconds
> Dec 28 08:05:34 server01 dhcpcd[462]: br0: writing lease `/var/lib/dhcpcd/br0.lease'
> Dec 28 08:05:34 server01 dhcpcd[462]: br0: adding IP address 192.168.14.10/24 broadcast 192.168.14.255
> Dec 28 08:05:34 server01 dhcpcd[462]: br0: adding route to 192.168.14.0/24
> Dec 28 08:05:34 server01 dhcpcd[462]: br0: adding default route via 192.168.14.1
> Dec 28 08:05:34 server01 dhcpcd[462]: br0: ARP announcing 192.168.14.10 (1 of 2), next in 2.0 seconds
> Dec 28 08:05:34 server01 dhcpcd[462]: br0: executing `/usr/lib/dhcpcd/dhcpcd-run-hooks' REBOOT
> Dec 28 08:05:34 server01 dhcpcd[462]: br0: ARP announcing 192.168.14.10 (1 of 2), next in 2.0 seconds
> Dec 28 08:05:34 server01 dhcpcd[462]: br0: executing `/usr/lib/dhcpcd/dhcpcd-run-hooks' REBOOT
> Dec 28 08:05:34 server01 dhcpcd[462]: forking to background
> Dec 28 08:05:34 server01 dhcpcd[462]: forking to background
> Dec 28 08:05:34 server01 dhcpcd[462]: forked to background, child pid 509
> Dec 28 08:05:34 server01 dhcpcd[462]: forked to background, child pid 509
> Dec 28 08:05:34 server01 waitip.sh[510]: waitip starting on br0
> Dec 28 08:05:34 server01 waitip.sh[510]: waitip waiting for ipv4 on br0
> Dec 28 08:05:34 server01 waitip.sh[510]: waitip waiting for ipv6 on br0
> Dec 28 08:05:34 server01 dhcpcd[509]: br0: soliciting an IPv6 router
> Dec 28 08:05:34 server01 dhcpcd[509]: br0: delaying Router Solicitation for LL address
> Dec 28 08:05:36 server01 dhcpcd[509]: br0: sending Router Solicitation
> Dec 28 08:05:36 server01 dhcpcd[509]: br0: Router Advertisement from fe80::xxxx:xxxx:xxxx:802d
> Dec 28 08:05:36 server01 dhcpcd[509]: br0: adding route to 26xx:xxx:xxxx:xxxx::/64
> Dec 28 08:05:36 server01 dhcpcd[509]: br0: adding default route via fe80::xxxx:xxxx:xxxx:802d
> Dec 28 08:05:36 server01 dhcpcd[509]: br0: executing `/usr/lib/dhcpcd/dhcpcd-run-hooks' ROUTERADVERT
> Dec 28 08:05:36 server01 dhcpcd[509]: br0: reading lease `/var/lib/dhcpcd/br0.lease6'
> Dec 28 08:05:36 server01 dhcpcd[509]: br0: confirming prior DHCPv6 lease
> Dec 28 08:05:36 server01 dhcpcd[509]: br0: delaying CONFIRM6 (xid 0xc4cb98), next in 0.2 seconds
> Dec 28 08:05:36 server01 dhcpcd[509]: br0: broadcasting CONFIRM6 (xid 0xc4cb98), next in 0.9 seconds
> Dec 28 08:05:36 server01 dhcpcd[509]: br0: REPLY6 received from fe80::xxxx:xxxx:xxxx:802d
> Dec 28 08:05:36 server01 dhcpcd[509]: br0: adding address 26xx:xxx:xxxx:xxxx::10/128
> Dec 28 08:05:36 server01 dhcpcd[509]: br0: pltime 86400 seconds, vltime 86400 seconds
> Dec 28 08:05:36 server01 dhcpcd[509]: br0: renew in 40085, rebind in 72485, expire in 86400 seconds
> Dec 28 08:05:36 server01 dhcpcd[509]: br0: writing lease `/var/lib/dhcpcd/br0.lease6'
> Dec 28 08:05:36 server01 dhcpcd[509]: br0: waiting for DHCPv6 DAD to complete
> Dec 28 08:05:36 server01 dhcpcd[509]: br0: ARP announcing 192.168.14.10 (2 of 2)
> Dec 28 08:06:04 server01 waitip.sh[510]: waitip timeout for ipv6 on br0
> Dec 28 08:06:04 server01 waitip.sh[510]: waitip finished on br0
> Dec 28 08:06:04 server01 systemd[1]: Started dhcpcd on br0.
> Dec 28 08:10:38 server01 systemd[1]: Stopping dhcpcd on br0...
> Dec 28 08:10:38 server01 dhcpcd[925]: sending signal TERM to pid 509
> Dec 28 08:10:38 server01 dhcpcd[925]: waiting for pid 509 to exit
> Dec 28 08:10:38 server01 dhcpcd[925]: sending signal TERM to pid 509
> Dec 28 08:10:38 server01 dhcpcd[925]: waiting for pid 509 to exit
> Dec 28 08:10:38 server01 dhcpcd[509]: received SIGTERM, stopping
> Dec 28 08:10:38 server01 dhcpcd[509]: br0: removing interface
> Dec 28 08:10:38 server01 dhcpcd[509]: br0: executing `/usr/lib/dhcpcd/dhcpcd-run-hooks' STOPPED
> Dec 28 08:10:38 server01 dhcpcd[509]: dhcpcd exited
> Dec 28 08:10:38 server01 systemd[1]: dhcpcd@br0.service: Succeeded.
> Dec 28 08:10:38 server01 systemd[1]: Stopped dhcpcd on br0.
>
> From: Roy Marples<mailto:roy@xxxxxxxxxxxx>
> Sent: Saturday, December 28, 2019 2:41 AM
> To: Steve Hirsch<mailto:stevehirsch49@xxxxxxx>; dhcpcd-discuss@xxxxxxxxxxxx<mailto:dhcpcd-discuss@xxxxxxxxxxxx>
> Subject: Re: Tentative global IPv6 addresses with 8.1.4
>
> On 28/12/2019 00:03, Steve Hirsch wrote:
>> Beginning with version 8.1.4 on Arch Linux, interfaces are receiving tentative
>> global IPv6 addresses.  The tentative addresses do not switch to permanent…even
>> after several minutes.  Reverting back to 8.1.2 and the problem goes away.
>
> Can you enable add debug to /etc/dhcpcd.conf please and post log?
> The kernel handles the transition from tentative to non tentative, so the only
> thing I can think of is that somehow the address is being added again and again
> very fast.
>
> Roy


--
Modern, affordable, Swiss Virtual Machines. Visit www.datacenterlight.ch

Follow-Ups:
Re: Tentative global IPv6 addresses with 8.1.4Gerdriaan Mulder
Re: Tentative global IPv6 addresses with 8.1.4Nico Schottelius
References:
Tentative global IPv6 addresses with 8.1.4Steve Hirsch
Re: Tentative global IPv6 addresses with 8.1.4Roy Marples
RE: Tentative global IPv6 addresses with 8.1.4Steve Hirsch
Archive administrator: postmaster@marples.name