On Mon, Feb 06, 2023 at 06:38:43PM +0300, [email protected] wrote:
> >Synopsis:    bgpd.conf connect-retry bug
> >Category:    system
> >Environment:
>       System      : OpenBSD 7.2
>       Details     : OpenBSD 7.2 (GENERIC.MP) #6: Sat Jan 21 01:03:04 MST 2023
>                        
> [email protected]:/usr/src/sys/arch/amd64/compile/GENERIC.MP
> 
>       Architecture: OpenBSD.amd64
>       Machine     : amd64
> >Description:
>       The "connect-retry" setting in a bgpd.conf file has no effect.
>       The output below shows that the time intervals between regular
>       connection attempts are greater then the configured time interval
>       of 300 seconds.

This is not a bug. You are looking at the wrong thing.
The "connect-retry" timer is only used when a connection attempt failed
(connect(2) failure or similar). You hit the IdleHold timer here because
the session is opened and a NOTIFICATION is sent back. This results in
exponential backoff of the connection and there the largest possible value
is 3600 seconds.

> >How-To-Repeat:
>       bgps# cat /etc/bgpd.conf | fgrep connect-retry
>       connect-retry 300
>       bgps# cat /var/log/daemon | fgrep "BGP IPv6 speaker 1"
>       Feb  4 19:12:04 bgps bgpd[56900]: neighbor 2a05:6d81:1::1:1 (BGP IPv6 
> speaker 1): state change Idle -> Connect, reason: Start
>       Feb  4 19:12:10 bgps bgpd[56900]: neighbor 2a05:6d81:1::1:1 (BGP IPv6 
> speaker 1): state change Connect -> OpenSent, reason: Connection opened
>       Feb  4 19:12:10 bgps bgpd[56900]: neighbor 2a05:6d81:1::1:1 (BGP IPv6 
> speaker 1): state change OpenSent -> OpenConfirm, reason: OPEN message 
> received
>       Feb  4 19:12:10 bgps bgpd[56900]: neighbor 2a05:6d81:1::1:1 (BGP IPv6 
> speaker 1): received notification: Cease, connection rejected
>       Feb  4 19:12:10 bgps bgpd[56900]: neighbor 2a05:6d81:1::1:1 (BGP IPv6 
> speaker 1): state change OpenConfirm -> Idle, reason: NOTIFICATION received
>       Feb  4 19:44:10 bgps bgpd[56900]: neighbor 2a05:6d81:1::1:1 (BGP IPv6 
> speaker 1): state change Idle -> Connect, reason: Start
>       Feb  4 19:44:10 bgps bgpd[56900]: neighbor 2a05:6d81:1::1:1 (BGP IPv6 
> speaker 1): state change Connect -> OpenSent, reason: Connection opened
>       Feb  4 19:44:10 bgps bgpd[56900]: neighbor 2a05:6d81:1::1:1 (BGP IPv6 
> speaker 1): state change OpenSent -> OpenConfirm, reason: OPEN message 
> received
>       Feb  4 19:44:10 bgps bgpd[56900]: neighbor 2a05:6d81:1::1:1 (BGP IPv6 
> speaker 1): received notification: Cease, connection rejected
>       Feb  4 19:44:10 bgps bgpd[56900]: neighbor 2a05:6d81:1::1:1 (BGP IPv6 
> speaker 1): state change OpenConfirm -> Idle, reason: NOTIFICATION received
>       Feb  4 20:16:10 bgps bgpd[56900]: neighbor 2a05:6d81:1::1:1 (BGP IPv6 
> speaker 1): state change Idle -> Connect, reason: Start
>       Feb  4 20:16:16 bgps bgpd[56900]: neighbor 2a05:6d81:1::1:1 (BGP IPv6 
> speaker 1): state change Connect -> OpenSent, reason: Connection opened
>       Feb  4 20:16:16 bgps bgpd[56900]: neighbor 2a05:6d81:1::1:1 (BGP IPv6 
> speaker 1): state change OpenSent -> OpenConfirm, reason: OPEN message 
> received
>       Feb  4 20:16:16 bgps bgpd[56900]: neighbor 2a05:6d81:1::1:1 (BGP IPv6 
> speaker 1): received notification: Cease, connection rejected
>       Feb  4 20:16:16 bgps bgpd[56900]: neighbor 2a05:6d81:1::1:1 (BGP IPv6 
> speaker 1): state change OpenConfirm -> Idle, reason: NOTIFICATION received
>       Feb  4 20:48:16 bgps bgpd[56900]: neighbor 2a05:6d81:1::1:1 (BGP IPv6 
> speaker 1): state change Idle -> Connect, reason: Start
>       Feb  4 20:48:22 bgps bgpd[56900]: neighbor 2a05:6d81:1::1:1 (BGP IPv6 
> speaker 1): state change Connect -> OpenSent, reason: Connection opened
>       Feb  4 20:48:22 bgps bgpd[56900]: neighbor 2a05:6d81:1::1:1 (BGP IPv6 
> speaker 1): state change OpenSent -> OpenConfirm, reason: OPEN message 
> received
>       Feb  4 20:48:22 bgps bgpd[56900]: neighbor 2a05:6d81:1::1:1 (BGP IPv6 
> speaker 1): received notification: Cease, connection rejected
>       Feb  4 20:48:22 bgps bgpd[56900]: neighbor 2a05:6d81:1::1:1 (BGP IPv6 
> speaker 1): state change OpenConfirm -> Idle, reason: NOTIFICATION received
>       Feb  4 21:20:22 bgps bgpd[56900]: neighbor 2a05:6d81:1::1:1 (BGP IPv6 
> speaker 1): state change Idle -> Connect, reason: Start
>       Feb  4 21:20:28 bgps bgpd[56900]: neighbor 2a05:6d81:1::1:1 (BGP IPv6 
> speaker 1): state change Connect -> OpenSent, reason: Connection opened
>       Feb  4 21:20:28 bgps bgpd[56900]: neighbor 2a05:6d81:1::1:1 (BGP IPv6 
> speaker 1): state change OpenSent -> OpenConfirm, reason: OPEN message 
> received
>       Feb  4 21:20:28 bgps bgpd[56900]: neighbor 2a05:6d81:1::1:1 (BGP IPv6 
> speaker 1): received notification: Cease, connection rejected
>       Feb  4 21:20:28 bgps bgpd[56900]: neighbor 2a05:6d81:1::1:1 (BGP IPv6 
> speaker 1): state change OpenConfirm -> Idle, reason: NOTIFICATION received
>       Feb  4 21:52:28 bgps bgpd[56900]: neighbor 2a05:6d81:1::1:1 (BGP IPv6 
> speaker 1): state change Idle -> Connect, reason: Start
>       Feb  4 21:52:34 bgps bgpd[56900]: neighbor 2a05:6d81:1::1:1 (BGP IPv6 
> speaker 1): state change Connect -> OpenSent, reason: Connection opened
>       Feb  4 21:52:34 bgps bgpd[56900]: neighbor 2a05:6d81:1::1:1 (BGP IPv6 
> speaker 1): state change OpenSent -> OpenConfirm, reason: OPEN message 
> received
>       Feb  4 21:52:34 bgps bgpd[56900]: neighbor 2a05:6d81:1::1:1 (BGP IPv6 
> speaker 1): received notification: Cease, connection rejected
>       Feb  4 21:52:34 bgps bgpd[56900]: neighbor 2a05:6d81:1::1:1 (BGP IPv6 
> speaker 1): state change OpenConfirm -> Idle, reason: NOTIFICATION received
>       Feb  4 22:24:34 bgps bgpd[56900]: neighbor 2a05:6d81:1::1:1 (BGP IPv6 
> speaker 1): state change Idle -> Connect, reason: Start
>       Feb  4 22:24:40 bgps bgpd[56900]: neighbor 2a05:6d81:1::1:1 (BGP IPv6 
> speaker 1): state change Connect -> OpenSent, reason: Connection opened
>       Feb  4 22:24:40 bgps bgpd[56900]: neighbor 2a05:6d81:1::1:1 (BGP IPv6 
> speaker 1): state change OpenSent -> OpenConfirm, reason: OPEN message 
> received
>       Feb  4 22:24:40 bgps bgpd[56900]: neighbor 2a05:6d81:1::1:1 (BGP IPv6 
> speaker 1): received notification: Cease, connection rejected
>       Feb  4 22:24:40 bgps bgpd[56900]: neighbor 2a05:6d81:1::1:1 (BGP IPv6 
> speaker 1): state change OpenConfirm -> Idle, reason: NOTIFICATION received
>       Feb  4 22:56:40 bgps bgpd[56900]: neighbor 2a05:6d81:1::1:1 (BGP IPv6 
> speaker 1): state change Idle -> Connect, reason: Start
>       Feb  4 22:56:46 bgps bgpd[56900]: neighbor 2a05:6d81:1::1:1 (BGP IPv6 
> speaker 1): state change Connect -> OpenSent, reason: Connection opened
>       Feb  4 22:56:46 bgps bgpd[56900]: neighbor 2a05:6d81:1::1:1 (BGP IPv6 
> speaker 1): state change OpenSent -> OpenConfirm, reason: OPEN message 
> received
>       Feb  4 22:56:46 bgps bgpd[56900]: neighbor 2a05:6d81:1::1:1 (BGP IPv6 
> speaker 1): received notification: Cease, connection rejected
>       Feb  4 22:56:46 bgps bgpd[56900]: neighbor 2a05:6d81:1::1:1 (BGP IPv6 
> speaker 1): state change OpenConfirm -> Idle, reason: NOTIFICATION received
>       Feb  4 23:28:46 bgps bgpd[56900]: neighbor 2a05:6d81:1::1:1 (BGP IPv6 
> speaker 1): state change Idle -> Connect, reason: Start
>       Feb  4 23:28:52 bgps bgpd[56900]: neighbor 2a05:6d81:1::1:1 (BGP IPv6 
> speaker 1): state change Connect -> OpenSent, reason: Connection opened
>       Feb  4 23:28:52 bgps bgpd[56900]: neighbor 2a05:6d81:1::1:1 (BGP IPv6 
> speaker 1): state change OpenSent -> OpenConfirm, reason: OPEN message 
> received
>       Feb  4 23:28:52 bgps bgpd[56900]: neighbor 2a05:6d81:1::1:1 (BGP IPv6 
> speaker 1): received notification: Cease, connection rejected
>       Feb  4 23:28:52 bgps bgpd[56900]: neighbor 2a05:6d81:1::1:1 (BGP IPv6 
> speaker 1): state change OpenConfirm -> Idle, reason: NOTIFICATION received
>       Feb  5 00:00:52 bgps bgpd[56900]: neighbor 2a05:6d81:1::1:1 (BGP IPv6 
> speaker 1): state change Idle -> Connect, reason: Start
>       Feb  5 00:00:58 bgps bgpd[56900]: neighbor 2a05:6d81:1::1:1 (BGP IPv6 
> speaker 1): state change Connect -> OpenSent, reason: Connection opened
>       Feb  5 00:00:58 bgps bgpd[56900]: neighbor 2a05:6d81:1::1:1 (BGP IPv6 
> speaker 1): state change OpenSent -> OpenConfirm, reason: OPEN message 
> received
>       Feb  5 00:00:58 bgps bgpd[56900]: neighbor 2a05:6d81:1::1:1 (BGP IPv6 
> speaker 1): received notification: Cease, connection rejected
>       Feb  5 00:00:58 bgps bgpd[56900]: neighbor 2a05:6d81:1::1:1 (BGP IPv6 
> speaker 1): state change OpenConfirm -> Idle, reason: NOTIFICATION received
> >Fix:
>       Unknown.
> 
> dmesg:
> OpenBSD 7.2 (GENERIC.MP) #6: Sat Jan 21 01:03:04 MST 2023
>     
> [email protected]:/usr/src/sys/arch/amd64/compile/GENERIC.MP
> real mem = 17161912320 (16366MB)
> avail mem = 16624394240 (15854MB)
> random: good seed from bootblocks
> mpath0 at root
> scsibus0 at mpath0: 256 targets
> mainbus0 at root
> bios0 at mainbus0: SMBIOS rev. 2.7 @ 0xe0010 (242 entries)
> bios0: vendor Phoenix Technologies LTD version "6.00" date 12/12/2018
> bios0: VMware, Inc. VMware Virtual Platform
> acpi0 at bios0: ACPI 4.0
> acpi0: sleep states S0 S1 S4 S5
> acpi0: tables DSDT FACP BOOT APIC MCFG SRAT HPET WAET
> acpi0: wakeup devices PCI0(S3) USB_(S1) P2P0(S3) S1F0(S3) S2F0(S3) S8F0(S3) 
> S16F(S3) S18F(S3) S22F(S3) S23F(S3) S24F(S3) S25F(S3) PE40(S3) S1F0(S3) 
> PE50(S3) S1F0(S3) [...]
> acpitimer0 at acpi0: 3579545 Hz, 24 bits
> acpimadt0 at acpi0 addr 0xfee00000: PC-AT compat
> cpu0 at mainbus0: apid 0 (boot processor)
> cpu0: Intel(R) Xeon(R) CPU X5660 @ 2.80GHz, 2799.29 MHz, 06-2c-02
> cpu0: 
> FPU,VME,DE,PSE,TSC,MSR,PAE,MCE,CX8,APIC,SEP,MTRR,PGE,MCA,CMOV,PAT,PSE36,CFLUSH,MMX,FXSR,SSE,SSE2,SS,SSE3,PCLMUL,SSSE3,CX16,SSE4.1,SSE4.2,x2APIC,POPCNT,DEADLINE,AES,HV,NXE,RDTSCP,LONG,LAHF,PERF,ITSC,TSC_ADJUST,IBRS,IBPB,STIBP,L1DF,SSBD,ARAT,MELTDOWN
> cpu0: 32KB 64b/line 8-way D-cache, 32KB 64b/line 4-way I-cache, 256KB 
> 64b/line 8-way L2 cache, 12MB 64b/line 16-way L3 cache
> cpu0: smt 0, core 0, package 0
> mtrr: Pentium Pro MTRR support, 8 var ranges, 88 fixed ranges
> cpu0: apic clock running at 66MHz
> cpu1 at mainbus0: apid 2 (application processor)
> cpu1: Intel(R) Xeon(R) CPU X5660 @ 2.80GHz, 2799.47 MHz, 06-2c-02
> cpu1: 
> FPU,VME,DE,PSE,TSC,MSR,PAE,MCE,CX8,APIC,SEP,MTRR,PGE,MCA,CMOV,PAT,PSE36,CFLUSH,MMX,FXSR,SSE,SSE2,SS,SSE3,PCLMUL,SSSE3,CX16,SSE4.1,SSE4.2,x2APIC,POPCNT,DEADLINE,AES,HV,NXE,RDTSCP,LONG,LAHF,PERF,ITSC,TSC_ADJUST,IBRS,IBPB,STIBP,L1DF,SSBD,ARAT,MELTDOWN
> cpu1: 32KB 64b/line 8-way D-cache, 32KB 64b/line 4-way I-cache, 256KB 
> 64b/line 8-way L2 cache, 12MB 64b/line 16-way L3 cache
> cpu1: smt 0, core 0, package 2
> ioapic0 at mainbus0: apid 1 pa 0xfec00000, version 20, 24 pins
> acpimcfg0 at acpi0
> acpimcfg0: addr 0xf0000000, bus 0-127
> acpihpet0 at acpi0: 14318179 Hz
> acpiprt0 at acpi0: bus 0 (PCI0)
> acpipci0 at acpi0 PCI0: 0x00000000 0x00000011 0x00000001
> acpicmos0 at acpi0
> "PNP0A05" at acpi0 not configured
> acpiac0 at acpi0: AC unit online
> acpicpu0 at acpi0: C1(@1 halt!)
> acpicpu1 at acpi0: C1(@1 halt!)
> cpu0: using IvyBridge MDS workaround
> pvbus0 at mainbus0: VMware
> vmt0 at pvbus0
> pci0 at mainbus0 bus 0
> pchb0 at pci0 dev 0 function 0 "Intel 82443BX AGP" rev 0x01
> ppb0 at pci0 dev 1 function 0 "Intel 82443BX AGP" rev 0x01
> pci1 at ppb0 bus 1
> pcib0 at pci0 dev 7 function 0 "Intel 82371AB PIIX4 ISA" rev 0x08
> pciide0 at pci0 dev 7 function 1 "Intel 82371AB IDE" rev 0x01: DMA, channel 0 
> configured to compatibility, channel 1 configured to compatibility
> pciide0: channel 0 disabled (no drives)
> pciide0: channel 1 disabled (no drives)
> piixpm0 at pci0 dev 7 function 3 "Intel 82371AB Power" rev 0x08: SMBus 
> disabled
> "VMware VMCI" rev 0x10 at pci0 dev 7 function 7 not configured
> vga1 at pci0 dev 15 function 0 "VMware SVGA II" rev 0x00
> wsdisplay0 at vga1 mux 1: console (80x25, vt100 emulation)
> wsdisplay0: screen 1-5 added (80x25, vt100 emulation)
> ppb1 at pci0 dev 17 function 0 "VMware PCI" rev 0x02
> pci2 at ppb1 bus 2
> uhci0 at pci2 dev 0 function 0 "VMware UHCI" rev 0x00: apic 1 int 18
> ehci0 at pci2 dev 1 function 0 "VMware EHCI" rev 0x00: apic 1 int 19
> usb0 at ehci0: USB revision 2.0
> uhub0 at usb0 configuration 1 interface 0 "VMware EHCI root hub" rev 
> 2.00/1.00 addr 1
> ahci0 at pci2 dev 3 function 0 "VMware AHCI" rev 0x00: msi, AHCI 1.3
> ahci0: port 0: 6.0Gb/s
> scsibus1 at ahci0: 32 targets
> cd0 at scsibus1 targ 0 lun 0: <NECVMWar, VMware SATA CD00, 1.00> removable
> vic0 at pci2 dev 4 function 0 "VMware VMXNET" rev 0x10: apic 1 int 18, 
> address 00:50:56:92:ba:80
> vic1 at pci2 dev 5 function 0 "VMware VMXNET" rev 0x10: apic 1 int 19, 
> address 00:50:56:92:64:01
> vic2 at pci2 dev 6 function 0 "VMware VMXNET" rev 0x10: apic 1 int 16, 
> address 00:50:56:92:be:12
> vic3 at pci2 dev 7 function 0 "VMware VMXNET" rev 0x10: apic 1 int 17, 
> address 00:50:56:92:12:ff
> usb1 at uhci0: USB revision 1.0
> uhub1 at usb1 configuration 1 interface 0 "VMware UHCI root hub" rev 
> 1.00/1.00 addr 1
> ppb2 at pci0 dev 21 function 0 "VMware PCIE" rev 0x01: msi
> pci3 at ppb2 bus 3
> mpi0 at pci3 dev 0 function 0 "Symbios Logic SAS1068" rev 0x01: msi
> mpi0: SAS3444, firmware 1.3.41.32
> scsibus2 at mpi0: 256 targets, initiator 16
> sd0 at scsibus2 targ 0 lun 0: <VMware, Virtual disk, 2.0>
> sd0: 262144MB, 512 bytes/sector, 536870912 sectors
> ppb3 at pci0 dev 21 function 1 "VMware PCIE" rev 0x01: msi
> pci4 at ppb3 bus 4
> ppb4 at pci0 dev 21 function 2 "VMware PCIE" rev 0x01: msi
> pci5 at ppb4 bus 5
> ppb5 at pci0 dev 21 function 3 "VMware PCIE" rev 0x01: msi
> pci6 at ppb5 bus 6
> ppb6 at pci0 dev 21 function 4 "VMware PCIE" rev 0x01: msi
> pci7 at ppb6 bus 7
> ppb7 at pci0 dev 21 function 5 "VMware PCIE" rev 0x01: msi
> pci8 at ppb7 bus 8
> ppb8 at pci0 dev 21 function 6 "VMware PCIE" rev 0x01: msi
> pci9 at ppb8 bus 9
> ppb9 at pci0 dev 21 function 7 "VMware PCIE" rev 0x01: msi
> pci10 at ppb9 bus 10
> ppb10 at pci0 dev 22 function 0 "VMware PCIE" rev 0x01: msi
> pci11 at ppb10 bus 11
> ppb11 at pci0 dev 22 function 1 "VMware PCIE" rev 0x01: msi
> pci12 at ppb11 bus 12
> ppb12 at pci0 dev 22 function 2 "VMware PCIE" rev 0x01: msi
> pci13 at ppb12 bus 13
> ppb13 at pci0 dev 22 function 3 "VMware PCIE" rev 0x01: msi
> pci14 at ppb13 bus 14
> ppb14 at pci0 dev 22 function 4 "VMware PCIE" rev 0x01: msi
> pci15 at ppb14 bus 15
> ppb15 at pci0 dev 22 function 5 "VMware PCIE" rev 0x01: msi
> pci16 at ppb15 bus 16
> ppb16 at pci0 dev 22 function 6 "VMware PCIE" rev 0x01: msi
> pci17 at ppb16 bus 17
> ppb17 at pci0 dev 22 function 7 "VMware PCIE" rev 0x01: msi
> pci18 at ppb17 bus 18
> ppb18 at pci0 dev 23 function 0 "VMware PCIE" rev 0x01: msi
> pci19 at ppb18 bus 19
> ppb19 at pci0 dev 23 function 1 "VMware PCIE" rev 0x01: msi
> pci20 at ppb19 bus 20
> ppb20 at pci0 dev 23 function 2 "VMware PCIE" rev 0x01: msi
> pci21 at ppb20 bus 21
> ppb21 at pci0 dev 23 function 3 "VMware PCIE" rev 0x01: msi
> pci22 at ppb21 bus 22
> ppb22 at pci0 dev 23 function 4 "VMware PCIE" rev 0x01: msi
> pci23 at ppb22 bus 23
> ppb23 at pci0 dev 23 function 5 "VMware PCIE" rev 0x01: msi
> pci24 at ppb23 bus 24
> ppb24 at pci0 dev 23 function 6 "VMware PCIE" rev 0x01: msi
> pci25 at ppb24 bus 25
> ppb25 at pci0 dev 23 function 7 "VMware PCIE" rev 0x01: msi
> pci26 at ppb25 bus 26
> ppb26 at pci0 dev 24 function 0 "VMware PCIE" rev 0x01: msi
> pci27 at ppb26 bus 27
> ppb27 at pci0 dev 24 function 1 "VMware PCIE" rev 0x01: msi
> pci28 at ppb27 bus 28
> ppb28 at pci0 dev 24 function 2 "VMware PCIE" rev 0x01: msi
> pci29 at ppb28 bus 29
> ppb29 at pci0 dev 24 function 3 "VMware PCIE" rev 0x01: msi
> pci30 at ppb29 bus 30
> ppb30 at pci0 dev 24 function 4 "VMware PCIE" rev 0x01: msi
> pci31 at ppb30 bus 31
> ppb31 at pci0 dev 24 function 5 "VMware PCIE" rev 0x01: msi
> pci32 at ppb31 bus 32
> ppb32 at pci0 dev 24 function 6 "VMware PCIE" rev 0x01: msi
> pci33 at ppb32 bus 33
> ppb33 at pci0 dev 24 function 7 "VMware PCIE" rev 0x01: msi
> pci34 at ppb33 bus 34
> isa0 at pcib0
> isadma0 at isa0
> pckbc0 at isa0 port 0x60/5 irq 1 irq 12
> pckbd0 at pckbc0 (kbd slot)
> wskbd0 at pckbd0: console keyboard, using wsdisplay0
> pms0 at pckbc0 (aux slot)
> wsmouse0 at pms0 mux 0
> pcppi0 at isa0 port 0x61
> spkr0 at pcppi0
> uhidev0 at uhub1 port 1 configuration 1 interface 0 "VMware VMware Virtual 
> USB Mouse" rev 1.10/1.02 addr 2
> uhidev0: iclass 3/0
> ums0 at uhidev0: 16 buttons, Z and W dir
> wsmouse1 at ums0 mux 0
> uhidev1 at uhub1 port 1 configuration 1 interface 1 "VMware VMware Virtual 
> USB Mouse" rev 1.10/1.02 addr 2
> uhidev1: iclass 3/0
> ums1 at uhidev1: 16 buttons, Z and W dir
> wsmouse2 at ums1 mux 0
> uhub2 at uhub1 port 2 configuration 1 interface 0 "VMware VMware Virtual USB 
> Hub" rev 1.10/1.00 addr 3
> vscsi0 at root
> scsibus3 at vscsi0: 256 targets
> softraid0 at root
> scsibus4 at softraid0: 256 targets
> root on sd0a (80e5da541ee52b0e.a) swap on sd0b dump on sd0b
> 
> 

-- 
:wq Claudio

Reply via email to