Diff of the two buildlogs: -- --- b1/build.log 2024-11-13 23:10:13.150612087 +0000 +++ b2/build.log 2024-11-13 23:16:34.945027684 +0000 @@ -1,6 +1,6 @@ I: pbuilder: network access will be disabled during build -I: Current time: Tue Dec 16 17:30:58 -12 2025 -I: pbuilder-time-stamp: 1765949458 +I: Current time: Thu Nov 14 13:10:16 +14 2024 +I: pbuilder-time-stamp: 1731539416 I: Building the build Environment I: extracting base tarball [/var/cache/pbuilder/trixie-reproducible-base.tgz] I: copying local configuration @@ -31,52 +31,84 @@ dpkg-source: info: applying 0004-Fix-untyped-int-overflow-on-32-bit-arch.patch I: Not using root during the build. I: Installing the build-deps -I: user script /srv/workspace/pbuilder/3722843/tmp/hooks/D02_print_environment starting +I: user script /srv/workspace/pbuilder/1663607/tmp/hooks/D01_modify_environment starting +debug: Running on ionos11-amd64. +I: Changing host+domainname to test build reproducibility +I: Adding a custom variable just for the fun of it... +I: Changing /bin/sh to bash +'/bin/sh' -> '/bin/bash' +lrwxrwxrwx 1 root root 9 Nov 13 23:10 /bin/sh -> /bin/bash +I: Setting pbuilder2's login shell to /bin/bash +I: Setting pbuilder2's GECOS to second user,second room,second work-phone,second home-phone,second other +I: user script /srv/workspace/pbuilder/1663607/tmp/hooks/D01_modify_environment finished +I: user script /srv/workspace/pbuilder/1663607/tmp/hooks/D02_print_environment starting I: set - BUILDDIR='/build/reproducible-path' - BUILDUSERGECOS='first user,first room,first work-phone,first home-phone,first other' - BUILDUSERNAME='pbuilder1' - BUILD_ARCH='amd64' - DEBIAN_FRONTEND='noninteractive' - DEB_BUILD_OPTIONS='buildinfo=+all reproducible=+all parallel=42 ' - DISTRIBUTION='trixie' - HOME='/root' - HOST_ARCH='amd64' + BASH=/bin/sh + BASHOPTS=checkwinsize:cmdhist:complete_fullquote:extquote:force_fignore:globasciiranges:globskipdots:hostcomplete:interactive_comments:patsub_replacement:progcomp:promptvars:sourcepath + BASH_ALIASES=() + BASH_ARGC=() + BASH_ARGV=() + BASH_CMDS=() + BASH_LINENO=([0]="12" [1]="0") + BASH_LOADABLES_PATH=/usr/local/lib/bash:/usr/lib/bash:/opt/local/lib/bash:/usr/pkg/lib/bash:/opt/pkg/lib/bash:. + BASH_SOURCE=([0]="/tmp/hooks/D02_print_environment" [1]="/tmp/hooks/D02_print_environment") + BASH_VERSINFO=([0]="5" [1]="2" [2]="32" [3]="1" [4]="release" [5]="x86_64-pc-linux-gnu") + BASH_VERSION='5.2.32(1)-release' + BUILDDIR=/build/reproducible-path + BUILDUSERGECOS='second user,second room,second work-phone,second home-phone,second other' + BUILDUSERNAME=pbuilder2 + BUILD_ARCH=amd64 + DEBIAN_FRONTEND=noninteractive + DEB_BUILD_OPTIONS='buildinfo=+all reproducible=+all parallel=20 ' + DIRSTACK=() + DISTRIBUTION=trixie + EUID=0 + FUNCNAME=([0]="Echo" [1]="main") + GROUPS=() + HOME=/root + HOSTNAME=i-capture-the-hostname + HOSTTYPE=x86_64 + HOST_ARCH=amd64 IFS=' ' - INVOCATION_ID='26d4f445ff614fe1a6920c3a064fee77' - LANG='C' - LANGUAGE='en_US:en' - LC_ALL='C' - MAIL='/var/mail/root' - OPTIND='1' - PATH='/usr/sbin:/usr/bin:/sbin:/bin:/usr/games' - PBCURRENTCOMMANDLINEOPERATION='build' - PBUILDER_OPERATION='build' - PBUILDER_PKGDATADIR='/usr/share/pbuilder' - PBUILDER_PKGLIBDIR='/usr/lib/pbuilder' - PBUILDER_SYSCONFDIR='/etc' - PPID='3722843' - PS1='# ' - PS2='> ' + INVOCATION_ID=d9ca1f7ce30247febf872ae7aa11eaf3 + LANG=C + LANGUAGE=et_EE:et + LC_ALL=C + MACHTYPE=x86_64-pc-linux-gnu + MAIL=/var/mail/root + OPTERR=1 + OPTIND=1 + OSTYPE=linux-gnu + PATH=/usr/sbin:/usr/bin:/sbin:/bin:/usr/games:/i/capture/the/path + PBCURRENTCOMMANDLINEOPERATION=build + PBUILDER_OPERATION=build + PBUILDER_PKGDATADIR=/usr/share/pbuilder + PBUILDER_PKGLIBDIR=/usr/lib/pbuilder + PBUILDER_SYSCONFDIR=/etc + PIPESTATUS=([0]="0") + POSIXLY_CORRECT=y + PPID=1663607 PS4='+ ' - PWD='/' - SHELL='/bin/bash' - SHLVL='2' - SUDO_COMMAND='/usr/bin/timeout -k 18.1h 18h /usr/bin/ionice -c 3 /usr/bin/nice /usr/sbin/pbuilder --build --configfile /srv/reproducible-results/rbuild-debian/r-b-build.mFRvpUup/pbuilderrc_sXqr --distribution trixie --hookdir /etc/pbuilder/first-build-hooks --debbuildopts -b --basetgz /var/cache/pbuilder/trixie-reproducible-base.tgz --buildresult /srv/reproducible-results/rbuild-debian/r-b-build.mFRvpUup/b1 --logfile b1/build.log golang-github-hashicorp-memberlist_0.5.0-1.dsc' - SUDO_GID='111' - SUDO_UID='106' - SUDO_USER='jenkins' - TERM='unknown' - TZ='/usr/share/zoneinfo/Etc/GMT+12' - USER='root' - _='/usr/bin/systemd-run' - http_proxy='http://213.165.73.152:3128' + PWD=/ + SHELL=/bin/bash + SHELLOPTS=braceexpand:errexit:hashall:interactive-comments:posix + SHLVL=3 + SUDO_COMMAND='/usr/bin/timeout -k 24.1h 24h /usr/bin/ionice -c 3 /usr/bin/nice -n 11 /usr/bin/unshare --uts -- /usr/sbin/pbuilder --build --configfile /srv/reproducible-results/rbuild-debian/r-b-build.mFRvpUup/pbuilderrc_LQA9 --distribution trixie --hookdir /etc/pbuilder/rebuild-hooks --debbuildopts -b --basetgz /var/cache/pbuilder/trixie-reproducible-base.tgz --buildresult /srv/reproducible-results/rbuild-debian/r-b-build.mFRvpUup/b2 --logfile b2/build.log golang-github-hashicorp-memberlist_0.5.0-1.dsc' + SUDO_GID=111 + SUDO_UID=106 + SUDO_USER=jenkins + TERM=unknown + TZ=/usr/share/zoneinfo/Etc/GMT-14 + UID=0 + USER=root + _='I: set' + http_proxy=http://46.16.76.132:3128 I: uname -a - Linux ionos15-amd64 6.10.11+bpo-amd64 #1 SMP PREEMPT_DYNAMIC Debian 6.10.11-1~bpo12+1 (2024-10-03) x86_64 GNU/Linux + Linux i-capture-the-hostname 6.1.0-27-amd64 #1 SMP PREEMPT_DYNAMIC Debian 6.1.115-1 (2024-11-01) x86_64 GNU/Linux I: ls -l /bin - lrwxrwxrwx 1 root root 7 Aug 4 2024 /bin -> usr/bin -I: user script /srv/workspace/pbuilder/3722843/tmp/hooks/D02_print_environment finished + lrwxrwxrwx 1 root root 7 Aug 4 21:30 /bin -> usr/bin +I: user script /srv/workspace/pbuilder/1663607/tmp/hooks/D02_print_environment finished -> Attempting to satisfy build-dependencies -> Creating pbuilder-satisfydepends-dummy package Package: pbuilder-satisfydepends-dummy @@ -240,7 +272,7 @@ Get: 108 http://deb.debian.org/debian trixie/main amd64 golang-github-hashicorp-go-multierror-dev all 1.1.1-2 [7804 B] Get: 109 http://deb.debian.org/debian trixie/main amd64 golang-github-hashicorp-go-sockaddr-dev all 1.0.2-2 [54.4 kB] Get: 110 http://deb.debian.org/debian trixie/main amd64 golang-github-miekg-dns-dev all 1.1.62-1 [178 kB] -Fetched 127 MB in 6s (20.9 MB/s) +Fetched 127 MB in 9s (13.6 MB/s) debconf: delaying package configuration, since apt-utils is not installed Selecting previously unselected package sensible-utils. (Reading database ... (Reading database ... 5% (Reading database ... 10% (Reading database ... 15% (Reading database ... 20% (Reading database ... 25% (Reading database ... 30% (Reading database ... 35% (Reading database ... 40% (Reading database ... 45% (Reading database ... 50% (Reading database ... 55% (Reading database ... 60% (Reading database ... 65% (Reading database ... 70% (Reading database ... 75% (Reading database ... 80% (Reading database ... 85% (Reading database ... 90% (Reading database ... 95% (Reading database ... 100% (Reading database ... 19972 files and directories currently installed.) @@ -695,7 +727,11 @@ Building tag database... -> Finished parsing the build-deps I: Building the package -I: Running cd /build/reproducible-path/golang-github-hashicorp-memberlist-0.5.0/ && env PATH="/usr/sbin:/usr/bin:/sbin:/bin:/usr/games" HOME="/nonexistent/first-build" dpkg-buildpackage -us -uc -b && env PATH="/usr/sbin:/usr/bin:/sbin:/bin:/usr/games" HOME="/nonexistent/first-build" dpkg-genchanges -S > ../golang-github-hashicorp-memberlist_0.5.0-1_source.changes +I: user script /srv/workspace/pbuilder/1663607/tmp/hooks/A99_set_merged_usr starting +Not re-configuring usrmerge for trixie +I: user script /srv/workspace/pbuilder/1663607/tmp/hooks/A99_set_merged_usr finished +hostname: Name or service not known +I: Running cd /build/reproducible-path/golang-github-hashicorp-memberlist-0.5.0/ && env PATH="/usr/sbin:/usr/bin:/sbin:/bin:/usr/games:/i/capture/the/path" HOME="/nonexistent/second-build" dpkg-buildpackage -us -uc -b && env PATH="/usr/sbin:/usr/bin:/sbin:/bin:/usr/games:/i/capture/the/path" HOME="/nonexistent/second-build" dpkg-genchanges -S > ../golang-github-hashicorp-memberlist_0.5.0-1_source.changes dpkg-buildpackage: info: source package golang-github-hashicorp-memberlist dpkg-buildpackage: info: source version 0.5.0-1 dpkg-buildpackage: info: source distribution unstable @@ -713,172 +749,172 @@ dh_autoreconf -O--buildsystem=golang dh_auto_configure -O--buildsystem=golang dh_auto_build -O--buildsystem=golang - cd obj-x86_64-linux-gnu && go install -trimpath -v -p 42 github.com/hashicorp/memberlist github.com/hashicorp/memberlist/internal/retry -internal/godebugs -internal/coverage/rtcov -internal/itoa + cd obj-x86_64-linux-gnu && go install -trimpath -v -p 20 github.com/hashicorp/memberlist github.com/hashicorp/memberlist/internal/retry +internal/goarch +internal/byteorder cmp -internal/profilerecord -unicode/utf8 -internal/msan -internal/goexperiment internal/unsafeheader -internal/nettrace -internal/byteorder -internal/race -internal/asan -golang.org/x/net/internal/iana -unicode/utf16 -container/list -vendor/golang.org/x/crypto/internal/alias -vendor/golang.org/x/crypto/cryptobyte/asn1 unicode -encoding +internal/coverage/rtcov +internal/race +internal/profilerecord +internal/godebugs internal/goos -internal/runtime/syscall -crypto/internal/boring/sig -crypto/subtle -internal/goarch -sync/atomic +internal/asan +internal/itoa internal/cpu -log/internal +internal/goexperiment math/bits -crypto/internal/alias +internal/abi +internal/msan internal/runtime/atomic +internal/chacha8rand runtime/internal/math +unicode/utf8 +container/list +sync/atomic +crypto/internal/boring/sig +log/internal +internal/runtime/syscall +crypto/subtle +internal/nettrace runtime/internal/sys -internal/abi -internal/chacha8rand +unicode/utf16 +crypto/internal/alias +encoding +vendor/golang.org/x/crypto/cryptobyte/asn1 +vendor/golang.org/x/crypto/internal/alias +golang.org/x/net/internal/iana internal/bytealg math internal/runtime/exithook internal/stringslite runtime -iter internal/reflectlite -internal/weak +iter sync -maps +internal/weak slices +maps +errors +sort internal/bisect -internal/singleflight internal/testlog +internal/singleflight runtime/cgo -errors -sort -internal/oserror io -path strconv -internal/godebug -crypto/internal/edwards25519/field +internal/oserror +path github.com/hashicorp/golang-lru/simplelru vendor/golang.org/x/net/dns/dnsmessage math/rand/v2 +crypto/internal/edwards25519/field crypto/internal/nistec/fiat syscall -math/rand +internal/godebug bytes hash -internal/saferio strings -crypto/internal/edwards25519 -crypto/internal/randutil internal/concurrent -hash/crc32 unique -crypto/rc4 -net/netip crypto -encoding/base32 +crypto/internal/edwards25519 reflect -vendor/golang.org/x/text/transform -crypto/cipher +crypto/rc4 +hash/crc32 +math/rand +internal/saferio +encoding/base32 +crypto/internal/randutil crypto/md5 +crypto/cipher +vendor/golang.org/x/text/transform +net/netip bufio +net/http/internal/ascii github.com/hashicorp/go-immutable-radix html -net/http/internal/ascii regexp/syntax -crypto/internal/boring crypto/des +crypto/internal/boring crypto/aes -crypto/sha512 crypto/hmac +crypto/sha512 crypto/sha1 crypto/sha256 vendor/golang.org/x/crypto/hkdf regexp -internal/syscall/unix -internal/syscall/execenv time -io/fs -internal/poll +internal/syscall/execenv +internal/syscall/unix context -internal/filepathlite +internal/poll +io/fs embed +internal/filepathlite crypto/internal/nistec os internal/fmtsort -encoding/binary github.com/hashicorp/errwrap -crypto/ecdh +encoding/binary vendor/golang.org/x/crypto/chacha20 -encoding/base64 vendor/golang.org/x/crypto/internal/poly1305 +encoding/base64 golang.org/x/sys/unix +crypto/ecdh encoding/pem -path/filepath -os/signal -vendor/golang.org/x/sys/cpu fmt net +os/signal +path/filepath +vendor/golang.org/x/sys/cpu +os/exec vendor/golang.org/x/crypto/sha3 vendor/golang.org/x/crypto/chacha20poly1305 -os/exec compress/lzw -log +mime +mime/quotedprintable +text/template/parse compress/flate +github.com/hashicorp/go-multierror encoding/hex +golang.org/x/net/bpf net/url math/big -net/http/internal -github.com/hashicorp/memberlist/internal/retry github.com/google/btree -mime/quotedprintable -mime -github.com/hashicorp/go-multierror +net/http/internal vendor/golang.org/x/net/http2/hpack -text/template/parse -golang.org/x/net/bpf -vendor/golang.org/x/text/unicode/norm go/token -encoding/json +vendor/golang.org/x/text/unicode/norm +log encoding/gob +encoding/json +github.com/hashicorp/memberlist/internal/retry vendor/golang.org/x/text/unicode/bidi compress/gzip vendor/golang.org/x/text/secure/bidirule -text/template vendor/golang.org/x/net/idna -crypto/internal/boring/bbig +text/template crypto/rand -encoding/asn1 -crypto/internal/bigmod crypto/elliptic +crypto/internal/bigmod +crypto/internal/boring/bbig crypto/dsa +encoding/asn1 crypto/ed25519 crypto/internal/hpke crypto/internal/mlkem768 github.com/hashicorp/memberlist/vendor/github.com/sean-/seed -crypto/rsa html/template -crypto/x509/pkix +crypto/rsa vendor/golang.org/x/crypto/cryptobyte +crypto/x509/pkix crypto/ecdsa -vendor/golang.org/x/net/http/httpproxy +crypto/x509 net/textproto +vendor/golang.org/x/net/http/httpproxy github.com/hashicorp/go-sockaddr -crypto/x509 golang.org/x/net/internal/socket vendor/golang.org/x/net/http/httpguts mime/multipart @@ -893,7 +929,7 @@ github.com/hashicorp/go-msgpack/codec github.com/hashicorp/memberlist dh_auto_test -O--buildsystem=golang - cd obj-x86_64-linux-gnu && go test -vet=off -v -p 42 github.com/hashicorp/memberlist github.com/hashicorp/memberlist/internal/retry + cd obj-x86_64-linux-gnu && go test -vet=off -v -p 20 github.com/hashicorp/memberlist github.com/hashicorp/memberlist/internal/retry === RUN TestAwareness --- PASS: TestAwareness (0.00s) === RUN TestMemberlistBroadcast_Invalidates @@ -931,61 +967,61 @@ --- PASS: TestAddLabelHeaderToPacket/message_with_almost_too_long_label (0.00s) --- PASS: TestAddLabelHeaderToPacket/label_too_long_by_one_byte (0.00s) === RUN TestRemoveLabelHeaderFromPacket -=== RUN TestRemoveLabelHeaderFromPacket/ping_with_no_label -=== RUN TestRemoveLabelHeaderFromPacket/v1_encrypt_with_no_label -=== RUN TestRemoveLabelHeaderFromPacket/buf_too_small_for_label -=== RUN TestRemoveLabelHeaderFromPacket/label_empty -=== RUN TestRemoveLabelHeaderFromPacket/label_truncated -=== RUN TestRemoveLabelHeaderFromPacket/v1_encrypt_with_label -=== RUN TestRemoveLabelHeaderFromPacket/empty_buf === RUN TestRemoveLabelHeaderFromPacket/error_with_no_label === RUN TestRemoveLabelHeaderFromPacket/buf_too_small_for_label_size +=== RUN TestRemoveLabelHeaderFromPacket/label_empty +=== RUN TestRemoveLabelHeaderFromPacket/label_truncated === RUN TestRemoveLabelHeaderFromPacket/ping_with_label === RUN TestRemoveLabelHeaderFromPacket/error_with_label +=== RUN TestRemoveLabelHeaderFromPacket/empty_buf +=== RUN TestRemoveLabelHeaderFromPacket/ping_with_no_label +=== RUN TestRemoveLabelHeaderFromPacket/v1_encrypt_with_no_label +=== RUN TestRemoveLabelHeaderFromPacket/buf_too_small_for_label +=== RUN TestRemoveLabelHeaderFromPacket/v1_encrypt_with_label --- PASS: TestRemoveLabelHeaderFromPacket (0.00s) - --- PASS: TestRemoveLabelHeaderFromPacket/ping_with_no_label (0.00s) - --- PASS: TestRemoveLabelHeaderFromPacket/v1_encrypt_with_no_label (0.00s) - --- PASS: TestRemoveLabelHeaderFromPacket/buf_too_small_for_label (0.00s) - --- PASS: TestRemoveLabelHeaderFromPacket/label_empty (0.00s) - --- PASS: TestRemoveLabelHeaderFromPacket/label_truncated (0.00s) - --- PASS: TestRemoveLabelHeaderFromPacket/v1_encrypt_with_label (0.00s) - --- PASS: TestRemoveLabelHeaderFromPacket/empty_buf (0.00s) --- PASS: TestRemoveLabelHeaderFromPacket/error_with_no_label (0.00s) --- PASS: TestRemoveLabelHeaderFromPacket/buf_too_small_for_label_size (0.00s) + --- PASS: TestRemoveLabelHeaderFromPacket/label_empty (0.00s) + --- PASS: TestRemoveLabelHeaderFromPacket/label_truncated (0.00s) --- PASS: TestRemoveLabelHeaderFromPacket/ping_with_label (0.00s) --- PASS: TestRemoveLabelHeaderFromPacket/error_with_label (0.00s) + --- PASS: TestRemoveLabelHeaderFromPacket/empty_buf (0.00s) + --- PASS: TestRemoveLabelHeaderFromPacket/ping_with_no_label (0.00s) + --- PASS: TestRemoveLabelHeaderFromPacket/v1_encrypt_with_no_label (0.00s) + --- PASS: TestRemoveLabelHeaderFromPacket/buf_too_small_for_label (0.00s) + --- PASS: TestRemoveLabelHeaderFromPacket/v1_encrypt_with_label (0.00s) === RUN TestAddLabelHeaderToStream -=== RUN TestAddLabelHeaderToStream/no_label -=== RUN TestAddLabelHeaderToStream/with_label === RUN TestAddLabelHeaderToStream/almost_too_long_label === RUN TestAddLabelHeaderToStream/label_too_long_by_one_byte +=== RUN TestAddLabelHeaderToStream/no_label +=== RUN TestAddLabelHeaderToStream/with_label --- PASS: TestAddLabelHeaderToStream (0.00s) - --- PASS: TestAddLabelHeaderToStream/no_label (0.00s) - --- PASS: TestAddLabelHeaderToStream/with_label (0.00s) --- PASS: TestAddLabelHeaderToStream/almost_too_long_label (0.00s) --- PASS: TestAddLabelHeaderToStream/label_too_long_by_one_byte (0.00s) + --- PASS: TestAddLabelHeaderToStream/no_label (0.00s) + --- PASS: TestAddLabelHeaderToStream/with_label (0.00s) === RUN TestRemoveLabelHeaderFromStream -=== RUN TestRemoveLabelHeaderFromStream/v1_encrypt_with_no_label -=== RUN TestRemoveLabelHeaderFromStream/buf_too_small_for_label -=== RUN TestRemoveLabelHeaderFromStream/buf_too_small_for_label_size -=== RUN TestRemoveLabelHeaderFromStream/ping_with_label === RUN TestRemoveLabelHeaderFromStream/empty_buf === RUN TestRemoveLabelHeaderFromStream/ping_with_no_label === RUN TestRemoveLabelHeaderFromStream/error_with_no_label +=== RUN TestRemoveLabelHeaderFromStream/buf_too_small_for_label_size === RUN TestRemoveLabelHeaderFromStream/label_empty === RUN TestRemoveLabelHeaderFromStream/label_truncated +=== RUN TestRemoveLabelHeaderFromStream/v1_encrypt_with_no_label +=== RUN TestRemoveLabelHeaderFromStream/buf_too_small_for_label +=== RUN TestRemoveLabelHeaderFromStream/ping_with_label === RUN TestRemoveLabelHeaderFromStream/error_with_label === RUN TestRemoveLabelHeaderFromStream/v1_encrypt_with_label --- PASS: TestRemoveLabelHeaderFromStream (0.00s) - --- PASS: TestRemoveLabelHeaderFromStream/v1_encrypt_with_no_label (0.00s) - --- PASS: TestRemoveLabelHeaderFromStream/buf_too_small_for_label (0.00s) - --- PASS: TestRemoveLabelHeaderFromStream/buf_too_small_for_label_size (0.00s) - --- PASS: TestRemoveLabelHeaderFromStream/ping_with_label (0.00s) --- PASS: TestRemoveLabelHeaderFromStream/empty_buf (0.00s) --- PASS: TestRemoveLabelHeaderFromStream/ping_with_no_label (0.00s) --- PASS: TestRemoveLabelHeaderFromStream/error_with_no_label (0.00s) + --- PASS: TestRemoveLabelHeaderFromStream/buf_too_small_for_label_size (0.00s) --- PASS: TestRemoveLabelHeaderFromStream/label_empty (0.00s) --- PASS: TestRemoveLabelHeaderFromStream/label_truncated (0.00s) + --- PASS: TestRemoveLabelHeaderFromStream/v1_encrypt_with_no_label (0.00s) + --- PASS: TestRemoveLabelHeaderFromStream/buf_too_small_for_label (0.00s) + --- PASS: TestRemoveLabelHeaderFromStream/ping_with_label (0.00s) --- PASS: TestRemoveLabelHeaderFromStream/error_with_label (0.00s) --- PASS: TestRemoveLabelHeaderFromStream/v1_encrypt_with_label (0.00s) === RUN TestLabelOverhead @@ -1027,13 +1063,13 @@ === RUN TestCreate_invalidLoggerSettings --- PASS: TestCreate_invalidLoggerSettings (0.00s) === RUN TestCreate -127.0.0.232025/12/17 05:32:32 [DEBUG] memberlist: Using dynamic bind port 36611 +127.0.0.232024/11/13 23:15:24 [DEBUG] memberlist: Using dynamic bind port 36115 --- PASS: TestCreate (0.25s) === RUN TestMemberList_CreateShutdown -127.0.0.242025/12/17 05:32:32 [DEBUG] memberlist: Using dynamic bind port 38593 +127.0.0.242024/11/13 23:15:24 [DEBUG] memberlist: Using dynamic bind port 33603 --- PASS: TestMemberList_CreateShutdown (0.00s) === RUN TestMemberList_ResolveAddr -127.0.0.252025/12/17 05:32:32 [DEBUG] memberlist: Using dynamic bind port 43461 +127.0.0.252024/11/13 23:15:24 [DEBUG] memberlist: Using dynamic bind port 46041 === RUN TestMemberList_ResolveAddr/localhost === PAUSE TestMemberList_ResolveAddr/localhost === RUN TestMemberList_ResolveAddr/localhost_(tagged) @@ -1077,321 +1113,321 @@ === RUN TestMemberList_ResolveAddr/ipv6_only_(tagged) === PAUSE TestMemberList_ResolveAddr/ipv6_only_(tagged) === CONT TestMemberList_ResolveAddr/localhost -=== CONT TestMemberList_ResolveAddr/ipv4_port_combo_(tagged) -=== CONT TestMemberList_ResolveAddr/ipv4_port_combo_with_empty_tag +=== CONT TestMemberList_ResolveAddr/ipv4_port_combo +=== CONT TestMemberList_ResolveAddr/ipv6_only_(tagged) === CONT TestMemberList_ResolveAddr/ipv6_only +=== CONT TestMemberList_ResolveAddr/ipv4_only_(tagged) +=== CONT TestMemberList_ResolveAddr/ipv4_only +=== CONT TestMemberList_ResolveAddr/ipv4_port_combo_with_empty_tag === CONT TestMemberList_ResolveAddr/ipv6_port_combo_(tagged) -=== CONT TestMemberList_ResolveAddr/ipv6_only_(tagged) -=== CONT TestMemberList_ResolveAddr/ipv4_port_combo +=== CONT TestMemberList_ResolveAddr/ipv6_port_combo === CONT TestMemberList_ResolveAddr/too_high_port_(tagged) +=== CONT TestMemberList_ResolveAddr/ipv4_port_combo_(tagged) === CONT TestMemberList_ResolveAddr/too_high_port -=== CONT TestMemberList_ResolveAddr/hostname_port_combo_(tagged) -=== CONT TestMemberList_ResolveAddr/hostname_port_combo -=== CONT TestMemberList_ResolveAddr/ipv6_non-pair -=== CONT TestMemberList_ResolveAddr/hostless_port === CONT TestMemberList_ResolveAddr/ipv6_non-pair_(tagged) -=== CONT TestMemberList_ResolveAddr/ipv6_port_combo -=== CONT TestMemberList_ResolveAddr/ipv6_pair +=== CONT TestMemberList_ResolveAddr/ipv6_non-pair +=== CONT TestMemberList_ResolveAddr/hostname_port_combo_(tagged) === CONT TestMemberList_ResolveAddr/ipv6_pair_(tagged) +=== CONT TestMemberList_ResolveAddr/ipv6_pair === CONT TestMemberList_ResolveAddr/localhost_(tagged) -=== CONT TestMemberList_ResolveAddr/ipv4_only_(tagged) -=== CONT TestMemberList_ResolveAddr/ipv4_only +=== CONT TestMemberList_ResolveAddr/hostname_port_combo === CONT TestMemberList_ResolveAddr/hostless_port_(tagged) +=== CONT TestMemberList_ResolveAddr/hostless_port --- PASS: TestMemberList_ResolveAddr (0.00s) - --- PASS: TestMemberList_ResolveAddr/ipv4_port_combo_(tagged) (0.00s) + --- PASS: TestMemberList_ResolveAddr/ipv4_port_combo (0.00s) + --- PASS: TestMemberList_ResolveAddr/ipv6_only_(tagged) (0.00s) --- PASS: TestMemberList_ResolveAddr/ipv6_only (0.00s) + --- PASS: TestMemberList_ResolveAddr/ipv4_only_(tagged) (0.00s) + --- PASS: TestMemberList_ResolveAddr/ipv4_only (0.00s) --- PASS: TestMemberList_ResolveAddr/ipv4_port_combo_with_empty_tag (0.00s) --- PASS: TestMemberList_ResolveAddr/ipv6_port_combo_(tagged) (0.00s) --- PASS: TestMemberList_ResolveAddr/localhost (0.00s) - --- PASS: TestMemberList_ResolveAddr/ipv6_only_(tagged) (0.00s) - --- PASS: TestMemberList_ResolveAddr/ipv4_port_combo (0.00s) + --- PASS: TestMemberList_ResolveAddr/ipv6_port_combo (0.00s) --- PASS: TestMemberList_ResolveAddr/too_high_port_(tagged) (0.00s) + --- PASS: TestMemberList_ResolveAddr/ipv4_port_combo_(tagged) (0.00s) --- PASS: TestMemberList_ResolveAddr/too_high_port (0.00s) - --- PASS: TestMemberList_ResolveAddr/hostname_port_combo_(tagged) (0.00s) - --- PASS: TestMemberList_ResolveAddr/ipv6_non-pair (0.00s) - --- PASS: TestMemberList_ResolveAddr/hostname_port_combo (0.00s) - --- PASS: TestMemberList_ResolveAddr/hostless_port (0.00s) --- PASS: TestMemberList_ResolveAddr/ipv6_non-pair_(tagged) (0.00s) - --- PASS: TestMemberList_ResolveAddr/ipv6_port_combo (0.00s) - --- PASS: TestMemberList_ResolveAddr/ipv6_pair (0.00s) + --- PASS: TestMemberList_ResolveAddr/ipv6_non-pair (0.00s) --- PASS: TestMemberList_ResolveAddr/ipv6_pair_(tagged) (0.00s) + --- PASS: TestMemberList_ResolveAddr/ipv6_pair (0.00s) + --- PASS: TestMemberList_ResolveAddr/hostname_port_combo_(tagged) (0.00s) + --- PASS: TestMemberList_ResolveAddr/hostname_port_combo (0.00s) --- PASS: TestMemberList_ResolveAddr/localhost_(tagged) (0.00s) - --- PASS: TestMemberList_ResolveAddr/ipv4_only_(tagged) (0.00s) - --- PASS: TestMemberList_ResolveAddr/ipv4_only (0.00s) --- PASS: TestMemberList_ResolveAddr/hostless_port_(tagged) (0.00s) + --- PASS: TestMemberList_ResolveAddr/hostless_port (0.00s) === RUN TestMemberList_ResolveAddr_TCP_First -127.0.0.262025/12/17 05:32:32 [DEBUG] memberlist: Using dynamic bind port 39645 +127.0.0.262024/11/13 23:15:24 [DEBUG] memberlist: Using dynamic bind port 45663 --- PASS: TestMemberList_ResolveAddr_TCP_First (0.00s) === RUN TestMemberList_Members --- PASS: TestMemberList_Members (0.00s) === RUN TestMemberlist_Join -127.0.0.272025/12/17 05:32:32 [DEBUG] memberlist: Using dynamic bind port 34971 -127.0.0.282025/12/17 05:32:32 [DEBUG] memberlist: Initiating push/pull sync with: 127.0.0.27 127.0.0.27:34971 -127.0.0.272025/12/17 05:32:32 [DEBUG] memberlist: Stream connection from=127.0.0.1:59272 +127.0.0.272024/11/13 23:15:24 [DEBUG] memberlist: Using dynamic bind port 38917 +127.0.0.282024/11/13 23:15:24 [DEBUG] memberlist: Initiating push/pull sync with: 127.0.0.27 127.0.0.27:38917 +127.0.0.272024/11/13 23:15:24 [DEBUG] memberlist: Stream connection from=127.0.0.1:46542 --- PASS: TestMemberlist_Join (0.00s) === RUN TestMemberlist_Join_with_Labels -127.0.0.292025/12/17 05:32:32 [DEBUG] memberlist: Using dynamic bind port 41663 +127.0.0.292024/11/13 23:15:24 [DEBUG] memberlist: Using dynamic bind port 41089 === RUN TestMemberlist_Join_with_Labels/same_label_can_join -127.0.0.302025/12/17 05:32:32 [DEBUG] memberlist: Initiating push/pull sync with: 127.0.0.29 127.0.0.29:41663 -127.0.0.292025/12/17 05:32:32 [DEBUG] memberlist: Stream connection from=127.0.0.1:52972 +127.0.0.292024/11/13 23:15:24 [DEBUG] memberlist: Stream connection from=127.0.0.1:38854 +127.0.0.302024/11/13 23:15:24 [DEBUG] memberlist: Initiating push/pull sync with: 127.0.0.29 127.0.0.29:41089 === RUN TestMemberlist_Join_with_Labels/no_label_cannot_join -127.0.0.312025/12/17 05:32:32 [DEBUG] memberlist: Initiating push/pull sync with: 127.0.0.29 127.0.0.29:41663 -127.0.0.292025/12/17 05:32:32 [DEBUG] memberlist: Stream connection from=127.0.0.1:52988 -127.0.0.292025/12/17 05:32:32 [ERR] memberlist: discarding stream with unacceptable label "": from=127.0.0.1:52988 -127.0.0.312025/12/17 05:32:32 [DEBUG] memberlist: Failed to join 127.0.0.29:41663: EOF +127.0.0.312024/11/13 23:15:24 [DEBUG] memberlist: Initiating push/pull sync with: 127.0.0.29 127.0.0.29:41089 +127.0.0.292024/11/13 23:15:24 [DEBUG] memberlist: Stream connection from=127.0.0.1:38868 +127.0.0.292024/11/13 23:15:24 [ERR] memberlist: discarding stream with unacceptable label "": from=127.0.0.1:38868 +127.0.0.312024/11/13 23:15:24 [DEBUG] memberlist: Failed to join 127.0.0.29:41089: EOF === RUN TestMemberlist_Join_with_Labels/mismatched_label_cannot_join -127.0.0.292025/12/17 05:32:32 [DEBUG] memberlist: Stream connection from=127.0.0.1:53004 -127.0.0.322025/12/17 05:32:32 [DEBUG] memberlist: Initiating push/pull sync with: 127.0.0.29 127.0.0.29:41663 -127.0.0.292025/12/17 05:32:32 [ERR] memberlist: discarding stream with unacceptable label "not-blah": from=127.0.0.1:53004 -127.0.0.322025/12/17 05:32:32 [DEBUG] memberlist: Failed to join 127.0.0.29:41663: EOF +127.0.0.292024/11/13 23:15:24 [DEBUG] memberlist: Stream connection from=127.0.0.1:38876 +127.0.0.322024/11/13 23:15:24 [DEBUG] memberlist: Initiating push/pull sync with: 127.0.0.29 127.0.0.29:41089 +127.0.0.292024/11/13 23:15:24 [ERR] memberlist: discarding stream with unacceptable label "not-blah": from=127.0.0.1:38876 +127.0.0.322024/11/13 23:15:24 [DEBUG] memberlist: Failed to join 127.0.0.29:41089: EOF --- PASS: TestMemberlist_Join_with_Labels (0.00s) --- PASS: TestMemberlist_Join_with_Labels/same_label_can_join (0.00s) --- PASS: TestMemberlist_Join_with_Labels/no_label_cannot_join (0.00s) --- PASS: TestMemberlist_Join_with_Labels/mismatched_label_cannot_join (0.00s) === RUN TestMemberlist_Join_with_Labels_and_Encryption -127.0.0.332025/12/17 05:32:32 [DEBUG] memberlist: Using dynamic bind port 36933 +127.0.0.332024/11/13 23:15:24 [DEBUG] memberlist: Using dynamic bind port 43319 === RUN TestMemberlist_Join_with_Labels_and_Encryption/same_label_can_join -127.0.0.342025/12/17 05:32:32 [DEBUG] memberlist: Initiating push/pull sync with: 127.0.0.33 127.0.0.33:36933 -127.0.0.332025/12/17 05:32:32 [DEBUG] memberlist: Stream connection from=127.0.0.1:37892 +127.0.0.332024/11/13 23:15:24 [DEBUG] memberlist: Stream connection from=127.0.0.1:44176 +127.0.0.342024/11/13 23:15:24 [DEBUG] memberlist: Initiating push/pull sync with: 127.0.0.33 127.0.0.33:43319 === RUN TestMemberlist_Join_with_Labels_and_Encryption/no_label_cannot_join -127.0.0.352025/12/17 05:32:32 [DEBUG] memberlist: Initiating push/pull sync with: 127.0.0.33 127.0.0.33:36933 -127.0.0.332025/12/17 05:32:32 [DEBUG] memberlist: Stream connection from=127.0.0.1:37894 -127.0.0.332025/12/17 05:32:32 [ERR] memberlist: discarding stream with unacceptable label "": from=127.0.0.1:37894 -127.0.0.352025/12/17 05:32:32 [DEBUG] memberlist: Failed to join 127.0.0.33:36933: EOF +127.0.0.352024/11/13 23:15:24 [DEBUG] memberlist: Initiating push/pull sync with: 127.0.0.33 127.0.0.33:43319 +127.0.0.332024/11/13 23:15:24 [DEBUG] memberlist: Stream connection from=127.0.0.1:44180 +127.0.0.332024/11/13 23:15:24 [ERR] memberlist: discarding stream with unacceptable label "": from=127.0.0.1:44180 +127.0.0.352024/11/13 23:15:24 [DEBUG] memberlist: Failed to join 127.0.0.33:43319: EOF === RUN TestMemberlist_Join_with_Labels_and_Encryption/mismatched_label_cannot_join -127.0.0.362025/12/17 05:32:32 [DEBUG] memberlist: Initiating push/pull sync with: 127.0.0.33 127.0.0.33:36933 -127.0.0.332025/12/17 05:32:32 [DEBUG] memberlist: Stream connection from=127.0.0.1:37906 -127.0.0.332025/12/17 05:32:32 [ERR] memberlist: discarding stream with unacceptable label "not-blah": from=127.0.0.1:37906 -127.0.0.362025/12/17 05:32:32 [DEBUG] memberlist: Failed to join 127.0.0.33:36933: EOF +127.0.0.362024/11/13 23:15:24 [DEBUG] memberlist: Initiating push/pull sync with: 127.0.0.33 127.0.0.33:43319 +127.0.0.332024/11/13 23:15:24 [DEBUG] memberlist: Stream connection from=127.0.0.1:44196 +127.0.0.332024/11/13 23:15:24 [ERR] memberlist: discarding stream with unacceptable label "not-blah": from=127.0.0.1:44196 +127.0.0.362024/11/13 23:15:24 [DEBUG] memberlist: Failed to join 127.0.0.33:43319: EOF --- PASS: TestMemberlist_Join_with_Labels_and_Encryption (0.00s) --- PASS: TestMemberlist_Join_with_Labels_and_Encryption/same_label_can_join (0.00s) --- PASS: TestMemberlist_Join_with_Labels_and_Encryption/no_label_cannot_join (0.00s) --- PASS: TestMemberlist_Join_with_Labels_and_Encryption/mismatched_label_cannot_join (0.00s) === RUN TestMemberlist_JoinDifferentNetworksUniqueMask -127.0.0.372025/12/17 05:32:32 [DEBUG] memberlist: Using dynamic bind port 35075 -127.0.1.382025/12/17 05:32:32 [DEBUG] memberlist: Initiating push/pull sync with: 127.0.0.37 127.0.0.37:35075 -127.0.0.372025/12/17 05:32:32 [DEBUG] memberlist: Stream connection from=127.0.0.1:46604 +127.0.0.372024/11/13 23:15:24 [DEBUG] memberlist: Using dynamic bind port 37843 +127.0.1.382024/11/13 23:15:24 [DEBUG] memberlist: Initiating push/pull sync with: 127.0.0.37 127.0.0.37:37843 +127.0.0.372024/11/13 23:15:24 [DEBUG] memberlist: Stream connection from=127.0.0.1:33806 --- PASS: TestMemberlist_JoinDifferentNetworksUniqueMask (0.00s) === RUN TestMemberlist_JoinDifferentNetworksMultiMasks -127.0.0.392025/12/17 05:32:32 [DEBUG] memberlist: Using dynamic bind port 36625 -127.0.1.402025/12/17 05:32:32 [DEBUG] memberlist: Initiating push/pull sync with: 127.0.0.39 127.0.0.39:36625 -127.0.0.392025/12/17 05:32:32 [DEBUG] memberlist: Stream connection from=127.0.0.1:39312 -127.0.2.412025/12/17 05:32:32 [DEBUG] memberlist: Initiating push/pull sync with: 127.0.0.39 127.0.0.39:36625 -127.0.0.392025/12/17 05:32:32 [DEBUG] memberlist: Stream connection from=127.0.0.1:39328 -127.0.0.392025/12/17 05:32:32 [WARN] memberlist: Rejected node 127.0.2.41 (127.0.2.41): 127.0.2.41 is not allowed -127.0.2.422025/12/17 05:32:32 [WARN] memberlist: Rejected node 127.0.2.42 (127.0.2.42): 127.0.2.42 is not allowed -127.0.2.422025/12/17 05:32:32 [DEBUG] memberlist: Failed to join 127.0.0.39:36625: memberlist: node names are required by configuration but one was not provided -127.0.2.422025/12/17 05:32:32 [DEBUG] memberlist: Failed to join 127.0.1.40:36625: memberlist: node names are required by configuration but one was not provided +127.0.0.392024/11/13 23:15:24 [DEBUG] memberlist: Using dynamic bind port 32883 +127.0.1.402024/11/13 23:15:24 [DEBUG] memberlist: Initiating push/pull sync with: 127.0.0.39 127.0.0.39:32883 +127.0.0.392024/11/13 23:15:24 [DEBUG] memberlist: Stream connection from=127.0.0.1:36410 +127.0.2.412024/11/13 23:15:24 [DEBUG] memberlist: Initiating push/pull sync with: 127.0.0.39 127.0.0.39:32883 +127.0.0.392024/11/13 23:15:24 [DEBUG] memberlist: Stream connection from=127.0.0.1:36420 +127.0.0.392024/11/13 23:15:24 [WARN] memberlist: Rejected node 127.0.2.41 (127.0.2.41): 127.0.2.41 is not allowed +127.0.2.422024/11/13 23:15:24 [WARN] memberlist: Rejected node 127.0.2.42 (127.0.2.42): 127.0.2.42 is not allowed +127.0.2.422024/11/13 23:15:24 [DEBUG] memberlist: Failed to join 127.0.0.39:32883: memberlist: node names are required by configuration but one was not provided +127.0.2.422024/11/13 23:15:24 [DEBUG] memberlist: Failed to join 127.0.1.40:32883: memberlist: node names are required by configuration but one was not provided --- PASS: TestMemberlist_JoinDifferentNetworksMultiMasks (0.00s) === RUN TestMemberlist_Join_Cancel -127.0.0.432025/12/17 05:32:32 [DEBUG] memberlist: Using dynamic bind port 33715 -127.0.0.442025/12/17 05:32:32 [DEBUG] memberlist: Initiating push/pull sync with: 127.0.0.43 127.0.0.43:33715 -127.0.0.432025/12/17 05:32:32 [DEBUG] memberlist: Stream connection from=127.0.0.1:59352 +127.0.0.432024/11/13 23:15:24 [DEBUG] memberlist: Using dynamic bind port 44285 +127.0.0.442024/11/13 23:15:24 [DEBUG] memberlist: Initiating push/pull sync with: 127.0.0.43 127.0.0.43:44285 +127.0.0.432024/11/13 23:15:24 [DEBUG] memberlist: Stream connection from=127.0.0.1:53920 memberlist_test.go:873: Cancel merge -127.0.0.432025/12/17 05:32:32 [ERR] memberlist: Failed push/pull merge: Custom merge canceled from=127.0.0.1:59352 +127.0.0.432024/11/13 23:15:24 [ERR] memberlist: Failed push/pull merge: Custom merge canceled from=127.0.0.1:53920 memberlist_test.go:873: Cancel merge -127.0.0.442025/12/17 05:32:32 [DEBUG] memberlist: Failed to join 127.0.0.43:33715: Custom merge canceled +127.0.0.442024/11/13 23:15:24 [DEBUG] memberlist: Failed to join 127.0.0.43:44285: Custom merge canceled --- PASS: TestMemberlist_Join_Cancel (0.00s) === RUN TestMemberlist_Join_Cancel_Passive -127.0.0.452025/12/17 05:32:32 [DEBUG] memberlist: Using dynamic bind port 34051 -127.0.0.462025/12/17 05:32:32 [DEBUG] memberlist: Initiating push/pull sync with: 127.0.0.45 127.0.0.45:34051 -127.0.0.452025/12/17 05:32:32 [DEBUG] memberlist: Stream connection from=127.0.0.1:46870 +127.0.0.452024/11/13 23:15:24 [DEBUG] memberlist: Using dynamic bind port 35179 +127.0.0.462024/11/13 23:15:24 [DEBUG] memberlist: Initiating push/pull sync with: 127.0.0.45 127.0.0.45:35179 +127.0.0.452024/11/13 23:15:24 [DEBUG] memberlist: Stream connection from=127.0.0.1:32928 memberlist_test.go:936: Cancel alive -127.0.0.452025/12/17 05:32:32 [WARN] memberlist: ignoring alive message for '127.0.0.46': Custom alive canceled +127.0.0.452024/11/13 23:15:24 [WARN] memberlist: ignoring alive message for '127.0.0.46': Custom alive canceled memberlist_test.go:936: Cancel alive -127.0.0.462025/12/17 05:32:32 [WARN] memberlist: ignoring alive message for '127.0.0.45': Custom alive canceled +127.0.0.462024/11/13 23:15:24 [WARN] memberlist: ignoring alive message for '127.0.0.45': Custom alive canceled --- PASS: TestMemberlist_Join_Cancel_Passive (0.00s) === RUN TestMemberlist_Join_protocolVersions -127.0.0.472025/12/17 05:32:32 [DEBUG] memberlist: Using dynamic bind port 45821 -127.0.0.472025/12/17 05:32:32 [DEBUG] memberlist: Initiating push/pull sync with: 127.0.0.48 127.0.0.48:45821 -127.0.0.482025/12/17 05:32:32 [DEBUG] memberlist: Stream connection from=127.0.0.1:47618 -127.0.0.472025/12/17 05:32:33 [DEBUG] memberlist: Initiating push/pull sync with: 127.0.0.49 127.0.0.49:45821 -127.0.0.492025/12/17 05:32:33 [DEBUG] memberlist: Stream connection from=127.0.0.1:40262 +127.0.0.472024/11/13 23:15:24 [DEBUG] memberlist: Using dynamic bind port 42379 +127.0.0.472024/11/13 23:15:24 [DEBUG] memberlist: Initiating push/pull sync with: 127.0.0.48 127.0.0.48:42379 +127.0.0.482024/11/13 23:15:24 [DEBUG] memberlist: Stream connection from=127.0.0.1:39534 +127.0.0.472024/11/13 23:15:25 [DEBUG] memberlist: Initiating push/pull sync with: 127.0.0.49 127.0.0.49:42379 +127.0.0.492024/11/13 23:15:25 [DEBUG] memberlist: Stream connection from=127.0.0.1:35960 --- PASS: TestMemberlist_Join_protocolVersions (0.25s) === RUN TestMemberlist_Leave -127.0.0.502025/12/17 05:32:33 [DEBUG] memberlist: Using dynamic bind port 46311 -127.0.0.512025/12/17 05:32:33 [DEBUG] memberlist: Initiating push/pull sync with: 127.0.0.50 127.0.0.50:46311 -127.0.0.502025/12/17 05:32:33 [DEBUG] memberlist: Stream connection from=127.0.0.1:39504 +127.0.0.502024/11/13 23:15:25 [DEBUG] memberlist: Using dynamic bind port 38185 +127.0.0.512024/11/13 23:15:25 [DEBUG] memberlist: Initiating push/pull sync with: 127.0.0.50 127.0.0.50:38185 +127.0.0.502024/11/13 23:15:25 [DEBUG] memberlist: Stream connection from=127.0.0.1:40138 --- PASS: TestMemberlist_Leave (0.02s) === RUN TestMemberlist_JoinShutdown -127.0.0.522025/12/17 05:32:33 [DEBUG] memberlist: Using dynamic bind port 37367 -127.0.0.532025/12/17 05:32:33 [DEBUG] memberlist: Initiating push/pull sync with: 127.0.0.52 127.0.0.52:37367 -127.0.0.522025/12/17 05:32:33 [DEBUG] memberlist: Stream connection from=127.0.0.1:48870 -127.0.0.532025/12/17 05:32:33 [DEBUG] memberlist: Failed UDP ping: 127.0.0.52 (timeout reached) -127.0.0.532025/12/17 05:32:33 [INFO] memberlist: Suspect 127.0.0.52 has failed, no acks received -127.0.0.532025/12/17 05:32:33 [DEBUG] memberlist: Failed UDP ping: 127.0.0.52 (timeout reached) -127.0.0.532025/12/17 05:32:33 [INFO] memberlist: Suspect 127.0.0.52 has failed, no acks received -127.0.0.532025/12/17 05:32:33 [INFO] memberlist: Marking 127.0.0.52 as failed, suspect timeout reached (0 peer confirmations) ---- PASS: TestMemberlist_JoinShutdown (0.01s) +127.0.0.522024/11/13 23:15:25 [DEBUG] memberlist: Using dynamic bind port 42383 +127.0.0.522024/11/13 23:15:25 [DEBUG] memberlist: Stream connection from=127.0.0.1:33298 +127.0.0.532024/11/13 23:15:25 [DEBUG] memberlist: Initiating push/pull sync with: 127.0.0.52 127.0.0.52:42383 +127.0.0.532024/11/13 23:15:25 [DEBUG] memberlist: Failed UDP ping: 127.0.0.52 (timeout reached) +127.0.0.532024/11/13 23:15:25 [INFO] memberlist: Suspect 127.0.0.52 has failed, no acks received +127.0.0.532024/11/13 23:15:25 [DEBUG] memberlist: Failed UDP ping: 127.0.0.52 (timeout reached) +127.0.0.532024/11/13 23:15:25 [INFO] memberlist: Suspect 127.0.0.52 has failed, no acks received +127.0.0.532024/11/13 23:15:25 [INFO] memberlist: Marking 127.0.0.52 as failed, suspect timeout reached (0 peer confirmations) +127.0.0.532024/11/13 23:15:25 [DEBUG] memberlist: Failed UDP ping: 127.0.0.52 (timeout reached) +127.0.0.532024/11/13 23:15:25 [INFO] memberlist: Suspect 127.0.0.52 has failed, no acks received +--- PASS: TestMemberlist_JoinShutdown (0.02s) === RUN TestMemberlist_delegateMeta -127.0.0.542025/12/17 05:32:33 [DEBUG] memberlist: Using dynamic bind port 39703 -127.0.0.542025/12/17 05:32:33 [DEBUG] memberlist: Initiating push/pull sync with: 127.0.0.55 127.0.0.55:39703 -127.0.0.552025/12/17 05:32:33 [DEBUG] memberlist: Stream connection from=127.0.0.1:39138 +127.0.0.542024/11/13 23:15:25 [DEBUG] memberlist: Using dynamic bind port 33983 +127.0.0.542024/11/13 23:15:25 [DEBUG] memberlist: Initiating push/pull sync with: 127.0.0.55 127.0.0.55:33983 +127.0.0.552024/11/13 23:15:25 [DEBUG] memberlist: Stream connection from=127.0.0.1:51534 --- PASS: TestMemberlist_delegateMeta (0.25s) === RUN TestMemberlist_delegateMeta_Update -127.0.0.562025/12/17 05:32:33 [DEBUG] memberlist: Using dynamic bind port 34295 -127.0.0.562025/12/17 05:32:33 [DEBUG] memberlist: Initiating push/pull sync with: 127.0.0.57 127.0.0.57:34295 -127.0.0.572025/12/17 05:32:33 [DEBUG] memberlist: Stream connection from=127.0.0.1:58696 +127.0.0.562024/11/13 23:15:25 [DEBUG] memberlist: Using dynamic bind port 40007 +127.0.0.562024/11/13 23:15:25 [DEBUG] memberlist: Initiating push/pull sync with: 127.0.0.57 127.0.0.57:40007 +127.0.0.572024/11/13 23:15:25 [DEBUG] memberlist: Stream connection from=127.0.0.1:59784 --- PASS: TestMemberlist_delegateMeta_Update (1.85s) === RUN TestMemberlist_UserData -127.0.0.582025/12/17 05:32:35 [DEBUG] memberlist: Using dynamic bind port 35317 -127.0.0.592025/12/17 05:32:35 [DEBUG] memberlist: Initiating push/pull sync with: 127.0.0.58 127.0.0.58:35317 -127.0.0.582025/12/17 05:32:35 [DEBUG] memberlist: Stream connection from=127.0.0.1:43682 ---- PASS: TestMemberlist_UserData (0.11s) +127.0.0.582024/11/13 23:15:27 [DEBUG] memberlist: Using dynamic bind port 44625 +127.0.0.592024/11/13 23:15:27 [DEBUG] memberlist: Initiating push/pull sync with: 127.0.0.58 127.0.0.58:44625 +127.0.0.582024/11/13 23:15:27 [DEBUG] memberlist: Stream connection from=127.0.0.1:36626 +--- PASS: TestMemberlist_UserData (0.12s) === RUN TestMemberlist_SendTo -127.0.0.602025/12/17 05:32:35 [DEBUG] memberlist: Using dynamic bind port 41295 -127.0.0.612025/12/17 05:32:35 [DEBUG] memberlist: Initiating push/pull sync with: 127.0.0.60 127.0.0.60:41295 -127.0.0.602025/12/17 05:32:35 [DEBUG] memberlist: Stream connection from=127.0.0.1:38616 -127.0.0.602025/12/17 05:32:35 [DEBUG] memberlist: Initiating push/pull sync with: 127.0.0.61 127.0.0.61:41295 -127.0.0.612025/12/17 05:32:35 [DEBUG] memberlist: Stream connection from=127.0.0.1:43676 -127.0.0.612025/12/17 05:32:35 [DEBUG] memberlist: Initiating push/pull sync with: 127.0.0.60 127.0.0.60:41295 -127.0.0.602025/12/17 05:32:35 [DEBUG] memberlist: Stream connection from=127.0.0.1:38626 -127.0.0.612025/12/17 05:32:35 [DEBUG] memberlist: Initiating push/pull sync with: 127.0.0.60 127.0.0.60:41295 -127.0.0.602025/12/17 05:32:35 [DEBUG] memberlist: Stream connection from=127.0.0.1:38638 -127.0.0.602025/12/17 05:32:35 [DEBUG] memberlist: Initiating push/pull sync with: 127.0.0.61 127.0.0.61:41295 -127.0.0.612025/12/17 05:32:35 [DEBUG] memberlist: Stream connection from=127.0.0.1:43684 +127.0.0.602024/11/13 23:15:27 [DEBUG] memberlist: Using dynamic bind port 44757 +127.0.0.612024/11/13 23:15:27 [DEBUG] memberlist: Initiating push/pull sync with: 127.0.0.60 127.0.0.60:44757 +127.0.0.602024/11/13 23:15:27 [DEBUG] memberlist: Stream connection from=127.0.0.1:53936 +127.0.0.612024/11/13 23:15:27 [DEBUG] memberlist: Stream connection from=127.0.0.1:40342 +127.0.0.602024/11/13 23:15:27 [DEBUG] memberlist: Initiating push/pull sync with: 127.0.0.61 127.0.0.61:44757 +127.0.0.612024/11/13 23:15:27 [DEBUG] memberlist: Initiating push/pull sync with: 127.0.0.60 127.0.0.60:44757 +127.0.0.602024/11/13 23:15:27 [DEBUG] memberlist: Stream connection from=127.0.0.1:53950 +127.0.0.612024/11/13 23:15:27 [DEBUG] memberlist: Initiating push/pull sync with: 127.0.0.60 127.0.0.60:44757 +127.0.0.602024/11/13 23:15:27 [DEBUG] memberlist: Initiating push/pull sync with: 127.0.0.61 127.0.0.61:44757 +127.0.0.602024/11/13 23:15:27 [DEBUG] memberlist: Stream connection from=127.0.0.1:53958 +127.0.0.612024/11/13 23:15:27 [DEBUG] memberlist: Stream connection from=127.0.0.1:40348 --- PASS: TestMemberlist_SendTo (0.01s) -127.0.0.602025/12/17 05:32:35 [ERR] memberlist: Push/Pull with 127.0.0.61 failed: dial tcp 127.0.0.61:41295: connect: connection reset by peer -127.0.0.612025/12/17 05:32:35 [ERR] memberlist: Push/Pull with 127.0.0.60 failed: dial tcp 127.0.0.60:41295: connect: connection reset by peer === RUN TestMemberlistProtocolVersion -127.0.0.622025/12/17 05:32:35 [DEBUG] memberlist: Using dynamic bind port 36539 +127.0.0.622024/11/13 23:15:27 [DEBUG] memberlist: Using dynamic bind port 35969 --- PASS: TestMemberlistProtocolVersion (0.00s) === RUN TestMemberlist_Join_DeadNode -127.0.0.632025/12/17 05:32:35 [DEBUG] memberlist: Using dynamic bind port 34487 -127.0.0.632025/12/17 05:32:35 [DEBUG] memberlist: Initiating push/pull sync with: fake 127.0.0.64:34487 -127.0.0.632025/12/17 05:32:35 [DEBUG] memberlist: Failed to join 127.0.0.64:34487: read tcp 127.0.0.1:54670->127.0.0.64:34487: i/o timeout +127.0.0.632024/11/13 23:15:27 [DEBUG] memberlist: Using dynamic bind port 44357 +127.0.0.632024/11/13 23:15:27 [DEBUG] memberlist: Initiating push/pull sync with: fake 127.0.0.64:44357 +127.0.0.632024/11/13 23:15:27 [DEBUG] memberlist: Failed to join 127.0.0.64:44357: read tcp 127.0.0.1:45690->127.0.0.64:44357: i/o timeout --- PASS: TestMemberlist_Join_DeadNode (0.05s) === RUN TestMemberlist_Join_Protocol_Compatibility === RUN TestMemberlist_Join_Protocol_Compatibility/2,1 -127.0.0.652025/12/17 05:32:35 [DEBUG] memberlist: Using dynamic bind port 36135 -127.0.0.662025/12/17 05:32:35 [DEBUG] memberlist: Initiating push/pull sync with: 127.0.0.65 127.0.0.65:36135 -127.0.0.652025/12/17 05:32:35 [DEBUG] memberlist: Stream connection from=127.0.0.1:42134 +127.0.0.652024/11/13 23:15:27 [DEBUG] memberlist: Using dynamic bind port 44085 +127.0.0.662024/11/13 23:15:27 [DEBUG] memberlist: Initiating push/pull sync with: 127.0.0.65 127.0.0.65:44085 +127.0.0.652024/11/13 23:15:27 [DEBUG] memberlist: Stream connection from=127.0.0.1:51814 === RUN TestMemberlist_Join_Protocol_Compatibility/2,3 -127.0.0.672025/12/17 05:32:35 [DEBUG] memberlist: Using dynamic bind port 33153 -127.0.0.682025/12/17 05:32:35 [DEBUG] memberlist: Initiating push/pull sync with: 127.0.0.67 127.0.0.67:33153 -127.0.0.672025/12/17 05:32:35 [DEBUG] memberlist: Stream connection from=127.0.0.1:37628 +127.0.0.672024/11/13 23:15:27 [DEBUG] memberlist: Using dynamic bind port 37789 +127.0.0.682024/11/13 23:15:27 [DEBUG] memberlist: Initiating push/pull sync with: 127.0.0.67 127.0.0.67:37789 +127.0.0.672024/11/13 23:15:27 [DEBUG] memberlist: Stream connection from=127.0.0.1:33228 === RUN TestMemberlist_Join_Protocol_Compatibility/3,2 -127.0.0.692025/12/17 05:32:35 [DEBUG] memberlist: Using dynamic bind port 39141 -127.0.0.702025/12/17 05:32:35 [DEBUG] memberlist: Initiating push/pull sync with: 127.0.0.69 127.0.0.69:39141 -127.0.0.692025/12/17 05:32:35 [DEBUG] memberlist: Stream connection from=127.0.0.1:36462 +127.0.0.692024/11/13 23:15:27 [DEBUG] memberlist: Using dynamic bind port 33595 +127.0.0.702024/11/13 23:15:27 [DEBUG] memberlist: Initiating push/pull sync with: 127.0.0.69 127.0.0.69:33595 +127.0.0.692024/11/13 23:15:27 [DEBUG] memberlist: Stream connection from=127.0.0.1:34412 === RUN TestMemberlist_Join_Protocol_Compatibility/3,1 -127.0.0.712025/12/17 05:32:35 [DEBUG] memberlist: Using dynamic bind port 33675 -127.0.0.722025/12/17 05:32:35 [DEBUG] memberlist: Initiating push/pull sync with: 127.0.0.71 127.0.0.71:33675 -127.0.0.712025/12/17 05:32:35 [DEBUG] memberlist: Stream connection from=127.0.0.1:51006 ---- PASS: TestMemberlist_Join_Protocol_Compatibility (0.00s) +127.0.0.712024/11/13 23:15:27 [DEBUG] memberlist: Using dynamic bind port 33861 +127.0.0.712024/11/13 23:15:27 [DEBUG] memberlist: Stream connection from=127.0.0.1:50552 +127.0.0.722024/11/13 23:15:27 [DEBUG] memberlist: Initiating push/pull sync with: 127.0.0.71 127.0.0.71:33861 +--- PASS: TestMemberlist_Join_Protocol_Compatibility (0.01s) --- PASS: TestMemberlist_Join_Protocol_Compatibility/2,1 (0.00s) --- PASS: TestMemberlist_Join_Protocol_Compatibility/2,3 (0.00s) --- PASS: TestMemberlist_Join_Protocol_Compatibility/3,2 (0.00s) --- PASS: TestMemberlist_Join_Protocol_Compatibility/3,1 (0.00s) === RUN TestMemberlist_Join_IPv6 -A2025/12/17 05:32:35 [DEBUG] memberlist: Using dynamic bind port 37489 -B2025/12/17 05:32:35 [DEBUG] memberlist: Using dynamic bind port 40613 -B2025/12/17 05:32:35 [DEBUG] memberlist: Initiating push/pull sync with: A [::1]:37489 -A2025/12/17 05:32:35 [DEBUG] memberlist: Stream connection from=[::1]:56746 +A2024/11/13 23:15:27 [DEBUG] memberlist: Using dynamic bind port 38437 +B2024/11/13 23:15:27 [DEBUG] memberlist: Using dynamic bind port 38943 +A2024/11/13 23:15:27 [DEBUG] memberlist: Stream connection from=[::1]:52288 +B2024/11/13 23:15:27 [DEBUG] memberlist: Initiating push/pull sync with: A [::1]:38437 --- PASS: TestMemberlist_Join_IPv6 (0.00s) === RUN TestAdvertiseAddr - memberlist_test.go:1647: Using dynamic bind port 45011 for BIND - memberlist_test.go:1647: Using dynamic bind port 38077 for ADVERTISE + memberlist_test.go:1647: Using dynamic bind port 40167 for BIND + memberlist_test.go:1647: Using dynamic bind port 43145 for ADVERTISE --- PASS: TestAdvertiseAddr (0.25s) === RUN TestMemberlist_conflictDelegate -127.0.0.752025/12/17 05:32:35 [DEBUG] memberlist: Using dynamic bind port 34621 -127.0.0.752025/12/17 05:32:35 [DEBUG] memberlist: Initiating push/pull sync with: 127.0.0.75 127.0.0.76:34621 -127.0.0.762025/12/17 05:32:35 [DEBUG] memberlist: Stream connection from=127.0.0.1:45254 -127.0.0.762025/12/17 05:32:35 [ERR] memberlist: Conflicting address for 127.0.0.75. Mine: 127.0.0.76:34621 Theirs: 127.0.0.75:34621 Old state: 0 -127.0.0.752025/12/17 05:32:35 [ERR] memberlist: Conflicting address for 127.0.0.75. Mine: 127.0.0.75:34621 Theirs: 127.0.0.76:34621 Old state: 0 +127.0.0.752024/11/13 23:15:27 [DEBUG] memberlist: Using dynamic bind port 45429 +127.0.0.752024/11/13 23:15:27 [DEBUG] memberlist: Initiating push/pull sync with: 127.0.0.75 127.0.0.76:45429 +127.0.0.762024/11/13 23:15:27 [DEBUG] memberlist: Stream connection from=127.0.0.1:60084 +127.0.0.762024/11/13 23:15:27 [ERR] memberlist: Conflicting address for 127.0.0.75. Mine: 127.0.0.76:45429 Theirs: 127.0.0.75:45429 Old state: 0 +127.0.0.752024/11/13 23:15:27 [ERR] memberlist: Conflicting address for 127.0.0.75. Mine: 127.0.0.75:45429 Theirs: 127.0.0.76:45429 Old state: 0 --- PASS: TestMemberlist_conflictDelegate (0.25s) === RUN TestMemberlist_PingDelegate -127.0.0.772025/12/17 05:32:35 [DEBUG] memberlist: Using dynamic bind port 44465 -127.0.0.782025/12/17 05:32:35 [DEBUG] memberlist: Initiating push/pull sync with: 127.0.0.77 127.0.0.77:44465 -127.0.0.772025/12/17 05:32:35 [DEBUG] memberlist: Stream connection from=127.0.0.1:51670 +127.0.0.772024/11/13 23:15:28 [DEBUG] memberlist: Using dynamic bind port 44757 +127.0.0.782024/11/13 23:15:28 [DEBUG] memberlist: Initiating push/pull sync with: 127.0.0.77 127.0.0.77:44757 +127.0.0.772024/11/13 23:15:28 [DEBUG] memberlist: Stream connection from=127.0.0.1:44260 --- PASS: TestMemberlist_PingDelegate (0.20s) === RUN TestMemberlist_EncryptedGossipTransition -m02025/12/17 05:32:36 [DEBUG] memberlist: Using dynamic bind port 33933 +m02024/11/13 23:15:28 [DEBUG] memberlist: Using dynamic bind port 32899 memberlist_test.go:1977: Node m1[127.0.0.80] joining node m0[127.0.0.79] -m12025/12/17 05:32:36 [DEBUG] memberlist: Initiating push/pull sync with: 127.0.0.79 127.0.0.79:33933 -m02025/12/17 05:32:36 [DEBUG] memberlist: Stream connection from=127.0.0.1:43762 +m02024/11/13 23:15:28 [DEBUG] memberlist: Stream connection from=127.0.0.1:36248 +m12024/11/13 23:15:28 [DEBUG] memberlist: Initiating push/pull sync with: 127.0.0.79 127.0.0.79:32899 memberlist_test.go:1979: ==== STEP 0 complete: two node unencrypted cluster ==== memberlist_test.go:1984: Node m0[127.0.0.79] is leaving to upgrade gossip to first stage memberlist_test.go:1984: Node m0[127.0.0.79] is shutting down to upgrade gossip to first stage memberlist_test.go:1996: Node m0[127.0.0.79] joining node m1[127.0.0.80] -m02025/12/17 05:32:36 [DEBUG] memberlist: Initiating push/pull sync with: 127.0.0.80 127.0.0.80:33933 -m12025/12/17 05:32:36 [DEBUG] memberlist: Stream connection from=127.0.0.1:35464 -m02025/12/17 05:32:36 [WARN] memberlist: Refuting a dead message (from: 127.0.0.79) +m02024/11/13 23:15:28 [DEBUG] memberlist: Initiating push/pull sync with: 127.0.0.80 127.0.0.80:32899 +m12024/11/13 23:15:28 [DEBUG] memberlist: Stream connection from=127.0.0.1:45938 +m02024/11/13 23:15:28 [WARN] memberlist: Refuting a dead message (from: 127.0.0.79) memberlist_test.go:1998: Node m1[127.0.0.80] is leaving to upgrade gossip to first stage memberlist_test.go:1998: Node m1[127.0.0.80] is shutting down to upgrade gossip to first stage memberlist_test.go:2010: Node m1[127.0.0.80] joining node m0[127.0.0.79] -m12025/12/17 05:32:37 [DEBUG] memberlist: Initiating push/pull sync with: 127.0.0.79 127.0.0.79:33933 -m02025/12/17 05:32:37 [DEBUG] memberlist: Stream connection from=127.0.0.1:43770 -m12025/12/17 05:32:37 [WARN] memberlist: Refuting a dead message (from: 127.0.0.80) +m12024/11/13 23:15:29 [DEBUG] memberlist: Initiating push/pull sync with: 127.0.0.79 127.0.0.79:32899 +m02024/11/13 23:15:29 [DEBUG] memberlist: Stream connection from=127.0.0.1:36254 +m12024/11/13 23:15:29 [WARN] memberlist: Refuting a dead message (from: 127.0.0.80) memberlist_test.go:2012: ==== STEP 1 complete: two node encryption-aware cluster ==== memberlist_test.go:2017: Node m0[127.0.0.79] is leaving to upgrade gossip to second stage memberlist_test.go:2017: Node m0[127.0.0.79] is shutting down to upgrade gossip to second stage memberlist_test.go:2028: Node m0[127.0.0.79] joining node m1[127.0.0.80] -m02025/12/17 05:32:38 [DEBUG] memberlist: Initiating push/pull sync with: 127.0.0.80 127.0.0.80:33933 -m12025/12/17 05:32:38 [DEBUG] memberlist: Stream connection from=127.0.0.1:35474 -m02025/12/17 05:32:38 [WARN] memberlist: Refuting a dead message (from: 127.0.0.79) +m02024/11/13 23:15:30 [DEBUG] memberlist: Initiating push/pull sync with: 127.0.0.80 127.0.0.80:32899 +m12024/11/13 23:15:30 [DEBUG] memberlist: Stream connection from=127.0.0.1:45948 +m02024/11/13 23:15:30 [WARN] memberlist: Refuting a dead message (from: 127.0.0.79) memberlist_test.go:2030: Node m1[127.0.0.80] is leaving to upgrade gossip to second stage memberlist_test.go:2030: Node m1[127.0.0.80] is shutting down to upgrade gossip to second stage memberlist_test.go:2042: Node m1[127.0.0.80] joining node m0[127.0.0.79] -m12025/12/17 05:32:39 [DEBUG] memberlist: Initiating push/pull sync with: 127.0.0.79 127.0.0.79:33933 -m02025/12/17 05:32:39 [DEBUG] memberlist: Stream connection from=127.0.0.1:43782 -m12025/12/17 05:32:39 [WARN] memberlist: Refuting a dead message (from: 127.0.0.80) +m12024/11/13 23:15:31 [DEBUG] memberlist: Initiating push/pull sync with: 127.0.0.79 127.0.0.79:32899 +m02024/11/13 23:15:31 [DEBUG] memberlist: Stream connection from=127.0.0.1:36264 +m12024/11/13 23:15:31 [WARN] memberlist: Refuting a dead message (from: 127.0.0.80) memberlist_test.go:2044: ==== STEP 2 complete: two node encryption-aware cluster being encrypted ==== memberlist_test.go:2049: Node m0[127.0.0.79] is leaving to upgrade gossip to final stage memberlist_test.go:2049: Node m0[127.0.0.79] is shutting down to upgrade gossip to final stage memberlist_test.go:2060: Node m0[127.0.0.79] joining node m1[127.0.0.80] -m02025/12/17 05:32:40 [DEBUG] memberlist: Initiating push/pull sync with: 127.0.0.80 127.0.0.80:33933 -m12025/12/17 05:32:40 [DEBUG] memberlist: Stream connection from=127.0.0.1:36910 -m02025/12/17 05:32:40 [WARN] memberlist: Refuting a dead message (from: 127.0.0.79) +m02024/11/13 23:15:32 [DEBUG] memberlist: Initiating push/pull sync with: 127.0.0.80 127.0.0.80:32899 +m12024/11/13 23:15:32 [DEBUG] memberlist: Stream connection from=127.0.0.1:45950 +m02024/11/13 23:15:32 [WARN] memberlist: Refuting a dead message (from: 127.0.0.79) memberlist_test.go:2062: Node m1[127.0.0.80] is leaving to upgrade gossip to final stage memberlist_test.go:2062: Node m1[127.0.0.80] is shutting down to upgrade gossip to final stage memberlist_test.go:2072: Node m1[127.0.0.80] joining node m0[127.0.0.79] -m12025/12/17 05:32:40 [DEBUG] memberlist: Initiating push/pull sync with: 127.0.0.79 127.0.0.79:33933 -m02025/12/17 05:32:40 [DEBUG] memberlist: Stream connection from=127.0.0.1:52872 -m12025/12/17 05:32:40 [WARN] memberlist: Refuting a dead message (from: 127.0.0.80) +m02024/11/13 23:15:33 [DEBUG] memberlist: Stream connection from=127.0.0.1:36274 +m12024/11/13 23:15:33 [DEBUG] memberlist: Initiating push/pull sync with: 127.0.0.79 127.0.0.79:32899 +m12024/11/13 23:15:33 [WARN] memberlist: Refuting a dead message (from: 127.0.0.80) memberlist_test.go:2074: ==== STEP 3 complete: two node encrypted cluster locked down ==== ---- PASS: TestMemberlist_EncryptedGossipTransition (5.31s) +--- PASS: TestMemberlist_EncryptedGossipTransition (5.51s) === RUN TestHandleCompoundPing -127.0.0.812025/12/17 05:32:41 [DEBUG] memberlist: Using dynamic bind port 41575 +127.0.0.812024/11/13 23:15:33 [DEBUG] memberlist: Using dynamic bind port 41321 --- PASS: TestHandleCompoundPing (0.00s) === RUN TestHandlePing -127.0.0.822025/12/17 05:32:41 [DEBUG] memberlist: Using dynamic bind port 35133 +127.0.0.822024/11/13 23:15:33 [DEBUG] memberlist: Using dynamic bind port 35919 --- PASS: TestHandlePing (0.00s) === RUN TestHandlePing_WrongNode -127.0.0.832025/12/17 05:32:41 [DEBUG] memberlist: Using dynamic bind port 44829 -127.0.0.832025/12/17 05:32:41 [WARN] memberlist: Got ping for unexpected node '127.0.0.83-bad' from=127.0.0.1:60000 +127.0.0.832024/11/13 23:15:33 [DEBUG] memberlist: Using dynamic bind port 33133 +127.0.0.832024/11/13 23:15:33 [WARN] memberlist: Got ping for unexpected node '127.0.0.83-bad' from=127.0.0.1:60000 --- PASS: TestHandlePing_WrongNode (0.05s) === RUN TestHandleIndirectPing -127.0.0.842025/12/17 05:32:41 [DEBUG] memberlist: Using dynamic bind port 42465 +127.0.0.842024/11/13 23:15:33 [DEBUG] memberlist: Using dynamic bind port 35989 --- PASS: TestHandleIndirectPing (0.00s) === RUN TestTCPPing -127.0.0.852025/12/17 05:32:41 [DEBUG] memberlist: Using dynamic bind port 33707 +127.0.0.852024/11/13 23:15:33 [DEBUG] memberlist: Using dynamic bind port 33989 --- PASS: TestTCPPing (0.00s) === RUN TestTCPPushPull -127.0.0.862025/12/17 05:32:41 [DEBUG] memberlist: Using dynamic bind port 41901 -127.0.0.862025/12/17 05:32:41 [DEBUG] memberlist: Stream connection from=127.0.0.1:49098 +127.0.0.862024/11/13 23:15:33 [DEBUG] memberlist: Using dynamic bind port 39777 +127.0.0.862024/11/13 23:15:33 [DEBUG] memberlist: Stream connection from=127.0.0.1:60688 --- PASS: TestTCPPushPull (0.00s) === RUN TestSendMsg_Piggyback -127.0.0.872025/12/17 05:32:41 [DEBUG] memberlist: Using dynamic bind port 36417 +127.0.0.872024/11/13 23:15:33 [DEBUG] memberlist: Using dynamic bind port 35003 --- PASS: TestSendMsg_Piggyback (0.00s) === RUN TestEncryptDecryptState -2025/12/17 05:32:41 [DEBUG] memberlist: Using dynamic bind port 43247 +2024/11/13 23:15:33 [DEBUG] memberlist: Using dynamic bind port 39785 --- PASS: TestEncryptDecryptState (0.00s) === RUN TestRawSendUdp_CRC -127.0.0.882025/12/17 05:32:41 [DEBUG] memberlist: Using dynamic bind port 46759 +127.0.0.882024/11/13 23:15:33 [DEBUG] memberlist: Using dynamic bind port 38867 --- PASS: TestRawSendUdp_CRC (0.00s) === RUN TestIngestPacket_CRC -127.0.0.892025/12/17 05:32:41 [DEBUG] memberlist: Using dynamic bind port 42337 +127.0.0.892024/11/13 23:15:33 [DEBUG] memberlist: Using dynamic bind port 43793 --- PASS: TestIngestPacket_CRC (0.00s) === RUN TestIngestPacket_ExportedFunc_EmptyMessage -127.0.0.902025/12/17 05:32:41 [DEBUG] memberlist: Using dynamic bind port 42055 +127.0.0.902024/11/13 23:15:33 [DEBUG] memberlist: Using dynamic bind port 38031 --- PASS: TestIngestPacket_ExportedFunc_EmptyMessage (0.00s) === RUN TestGossip_MismatchedKeys -127.0.0.912025/12/17 05:32:41 [DEBUG] memberlist: Using dynamic bind port 39755 -127.0.0.922025/12/17 05:32:41 [DEBUG] memberlist: Initiating push/pull sync with: 127.0.0.91 127.0.0.91:39755 -127.0.0.912025/12/17 05:32:41 [DEBUG] memberlist: Stream connection from=127.0.0.1:35716 -127.0.0.912025/12/17 05:32:41 [ERR] memberlist: failed to receive: No installed keys could decrypt the message from=127.0.0.1:35716 -127.0.0.922025/12/17 05:32:41 [DEBUG] memberlist: Failed to join 127.0.0.91:39755: No installed keys could decrypt the message +127.0.0.912024/11/13 23:15:33 [DEBUG] memberlist: Using dynamic bind port 46805 +127.0.0.922024/11/13 23:15:33 [DEBUG] memberlist: Initiating push/pull sync with: 127.0.0.91 127.0.0.91:46805 +127.0.0.912024/11/13 23:15:33 [DEBUG] memberlist: Stream connection from=127.0.0.1:54754 +127.0.0.912024/11/13 23:15:33 [ERR] memberlist: failed to receive: No installed keys could decrypt the message from=127.0.0.1:54754 +127.0.0.922024/11/13 23:15:33 [DEBUG] memberlist: Failed to join 127.0.0.91:46805: No installed keys could decrypt the message --- PASS: TestGossip_MismatchedKeys (0.00s) === RUN TestHandleCommand --- PASS: TestHandleCommand (0.00s) @@ -1420,86 +1456,85 @@ === RUN TestEncryptDecrypt_V1 --- PASS: TestEncryptDecrypt_V1 (0.00s) === RUN TestMemberList_Probe -127.0.0.932025/12/17 05:32:41 [DEBUG] memberlist: Using dynamic bind port 36279 -127.0.0.942025/12/17 05:32:41 [WARN] memberlist: Refuting an alive message for '127.0.0.94' (127.0.0.94:36279) meta:([] VS []), vsn:([1 5 2 0 0 0] VS [1 5 2 0 0 0]) +127.0.0.932024/11/13 23:15:33 [DEBUG] memberlist: Using dynamic bind port 41305 +127.0.0.942024/11/13 23:15:33 [WARN] memberlist: Refuting an alive message for '127.0.0.94' (127.0.0.94:41305) meta:([] VS []), vsn:([1 5 2 0 0 0] VS [1 5 2 0 0 0]) --- PASS: TestMemberList_Probe (0.00s) === RUN TestMemberList_ProbeNode_Suspect -127.0.0.952025/12/17 05:32:41 [DEBUG] memberlist: Using dynamic bind port 35859 -127.0.0.952025/12/17 05:32:41 [DEBUG] memberlist: Failed UDP ping: 127.0.0.98 (timeout reached) -127.0.0.962025/12/17 05:32:41 [WARN] memberlist: Refuting an alive message for '127.0.0.96' (127.0.0.96:35859) meta:([] VS []), vsn:([1 5 2 0 0 0] VS [1 5 2 0 0 0]) -127.0.0.972025/12/17 05:32:41 [WARN] memberlist: Refuting an alive message for '127.0.0.97' (127.0.0.97:35859) meta:([] VS []), vsn:([1 5 2 0 0 0] VS [1 5 2 0 0 0]) -127.0.0.952025/12/17 05:32:41 [INFO] memberlist: Suspect 127.0.0.98 has failed, no acks received +127.0.0.952024/11/13 23:15:33 [DEBUG] memberlist: Using dynamic bind port 43747 +127.0.0.952024/11/13 23:15:33 [DEBUG] memberlist: Failed UDP ping: 127.0.0.98 (timeout reached) +127.0.0.962024/11/13 23:15:33 [WARN] memberlist: Refuting an alive message for '127.0.0.96' (127.0.0.96:43747) meta:([] VS []), vsn:([1 5 2 0 0 0] VS [1 5 2 0 0 0]) +127.0.0.972024/11/13 23:15:33 [WARN] memberlist: Refuting an alive message for '127.0.0.97' (127.0.0.97:43747) meta:([] VS []), vsn:([1 5 2 0 0 0] VS [1 5 2 0 0 0]) +127.0.0.952024/11/13 23:15:33 [INFO] memberlist: Suspect 127.0.0.98 has failed, no acks received --- PASS: TestMemberList_ProbeNode_Suspect (0.02s) === RUN TestMemberList_ProbeNode_Suspect_Dogpile === RUN TestMemberList_ProbeNode_Suspect_Dogpile/n=2,_k=3_(max_timeout_disabled) -127.0.0.992025/12/17 05:32:41 [DEBUG] memberlist: Using dynamic bind port 35919 -127.0.0.992025/12/17 05:32:41 [DEBUG] memberlist: Failed UDP ping: 127.0.0.100 (timeout reached) -127.0.0.992025/12/17 05:32:41 [INFO] memberlist: Suspect 127.0.0.100 has failed, no acks received -127.0.0.952025/12/17 05:32:41 [INFO] memberlist: Marking 127.0.0.98 as failed, suspect timeout reached (0 peer confirmations) -127.0.0.972025/12/17 05:32:41 [ERR] memberlist: Failed to send nack: write udp 127.0.0.97:35859->127.0.0.95:35859: use of closed network connection from=127.0.0.95:35859 -127.0.0.962025/12/17 05:32:41 [ERR] memberlist: Failed to send nack: write udp 127.0.0.96:35859->127.0.0.95:35859: use of closed network connection from=127.0.0.95:35859 -127.0.0.992025/12/17 05:32:42 [INFO] memberlist: Marking 127.0.0.100 as failed, suspect timeout reached (0 peer confirmations) +127.0.0.992024/11/13 23:15:33 [DEBUG] memberlist: Using dynamic bind port 37767 +127.0.0.992024/11/13 23:15:33 [DEBUG] memberlist: Failed UDP ping: 127.0.0.100 (timeout reached) +127.0.0.992024/11/13 23:15:33 [INFO] memberlist: Suspect 127.0.0.100 has failed, no acks received +127.0.0.952024/11/13 23:15:34 [INFO] memberlist: Marking 127.0.0.98 as failed, suspect timeout reached (0 peer confirmations) +127.0.0.972024/11/13 23:15:34 [ERR] memberlist: Failed to send nack: write udp 127.0.0.97:43747->127.0.0.95:43747: use of closed network connection from=127.0.0.95:43747 +127.0.0.962024/11/13 23:15:34 [ERR] memberlist: Failed to send nack: write udp 127.0.0.96:43747->127.0.0.95:43747: use of closed network connection from=127.0.0.95:43747 +127.0.0.992024/11/13 23:15:34 [INFO] memberlist: Marking 127.0.0.100 as failed, suspect timeout reached (0 peer confirmations) === RUN TestMemberList_ProbeNode_Suspect_Dogpile/n=3,_k=3 -127.0.0.1012025/12/17 05:32:42 [DEBUG] memberlist: Using dynamic bind port 37945 -127.0.0.1012025/12/17 05:32:42 [DEBUG] memberlist: Failed UDP ping: 127.0.0.103 (timeout reached) -127.0.0.1022025/12/17 05:32:42 [WARN] memberlist: Refuting an alive message for '127.0.0.102' (127.0.0.102:37945) meta:([] VS []), vsn:([1 5 2 0 0 0] VS [1 5 2 0 0 0]) -127.0.0.1012025/12/17 05:32:42 [INFO] memberlist: Suspect 127.0.0.103 has failed, no acks received -127.0.0.1012025/12/17 05:32:42 [INFO] memberlist: Marking 127.0.0.103 as failed, suspect timeout reached (0 peer confirmations) +127.0.0.1012024/11/13 23:15:34 [DEBUG] memberlist: Using dynamic bind port 40951 +127.0.0.1012024/11/13 23:15:34 [DEBUG] memberlist: Failed UDP ping: 127.0.0.103 (timeout reached) +127.0.0.1022024/11/13 23:15:34 [WARN] memberlist: Refuting an alive message for '127.0.0.102' (127.0.0.102:40951) meta:([] VS []), vsn:([1 5 2 0 0 0] VS [1 5 2 0 0 0]) +127.0.0.1012024/11/13 23:15:34 [INFO] memberlist: Suspect 127.0.0.103 has failed, no acks received +127.0.0.1012024/11/13 23:15:35 [INFO] memberlist: Marking 127.0.0.103 as failed, suspect timeout reached (0 peer confirmations) === RUN TestMemberList_ProbeNode_Suspect_Dogpile/n=4,_k=3 -127.0.0.1042025/12/17 05:32:42 [DEBUG] memberlist: Using dynamic bind port 33393 -127.0.0.1042025/12/17 05:32:42 [DEBUG] memberlist: Failed UDP ping: 127.0.0.107 (timeout reached) -127.0.0.1062025/12/17 05:32:42 [WARN] memberlist: Refuting an alive message for '127.0.0.106' (127.0.0.106:33393) meta:([] VS []), vsn:([1 5 2 0 0 0] VS [1 5 2 0 0 0]) -127.0.0.1052025/12/17 05:32:42 [WARN] memberlist: Refuting an alive message for '127.0.0.105' (127.0.0.105:33393) meta:([] VS []), vsn:([1 5 2 0 0 0] VS [1 5 2 0 0 0]) -127.0.0.1042025/12/17 05:32:42 [INFO] memberlist: Suspect 127.0.0.107 has failed, no acks received -127.0.0.1042025/12/17 05:32:43 [INFO] memberlist: Marking 127.0.0.107 as failed, suspect timeout reached (0 peer confirmations) +127.0.0.1042024/11/13 23:15:35 [DEBUG] memberlist: Using dynamic bind port 39205 +127.0.0.1042024/11/13 23:15:35 [DEBUG] memberlist: Failed UDP ping: 127.0.0.107 (timeout reached) +127.0.0.1052024/11/13 23:15:35 [WARN] memberlist: Refuting an alive message for '127.0.0.105' (127.0.0.105:39205) meta:([] VS []), vsn:([1 5 2 0 0 0] VS [1 5 2 0 0 0]) +127.0.0.1062024/11/13 23:15:35 [WARN] memberlist: Refuting an alive message for '127.0.0.106' (127.0.0.106:39205) meta:([] VS []), vsn:([1 5 2 0 0 0] VS [1 5 2 0 0 0]) +127.0.0.1042024/11/13 23:15:35 [INFO] memberlist: Suspect 127.0.0.107 has failed, no acks received +127.0.0.1042024/11/13 23:15:35 [INFO] memberlist: Marking 127.0.0.107 as failed, suspect timeout reached (0 peer confirmations) === RUN TestMemberList_ProbeNode_Suspect_Dogpile/n=5,_k=3_(max_timeout_starts_to_take_effect) -127.0.0.1082025/12/17 05:32:43 [DEBUG] memberlist: Using dynamic bind port 42525 -127.0.0.1082025/12/17 05:32:43 [DEBUG] memberlist: Failed UDP ping: 127.0.0.112 (timeout reached) -127.0.0.1102025/12/17 05:32:43 [WARN] memberlist: Refuting an alive message for '127.0.0.110' (127.0.0.110:42525) meta:([] VS []), vsn:([1 5 2 0 0 0] VS [1 5 2 0 0 0]) -127.0.0.1112025/12/17 05:32:43 [WARN] memberlist: Refuting an alive message for '127.0.0.111' (127.0.0.111:42525) meta:([] VS []), vsn:([1 5 2 0 0 0] VS [1 5 2 0 0 0]) -127.0.0.1092025/12/17 05:32:43 [WARN] memberlist: Refuting an alive message for '127.0.0.109' (127.0.0.109:42525) meta:([] VS []), vsn:([1 5 2 0 0 0] VS [1 5 2 0 0 0]) -127.0.0.1082025/12/17 05:32:43 [INFO] memberlist: Suspect 127.0.0.112 has failed, no acks received -127.0.0.1082025/12/17 05:32:44 [INFO] memberlist: Marking 127.0.0.112 as failed, suspect timeout reached (0 peer confirmations) +127.0.0.1082024/11/13 23:15:35 [DEBUG] memberlist: Using dynamic bind port 42051 +127.0.0.1082024/11/13 23:15:35 [DEBUG] memberlist: Failed UDP ping: 127.0.0.112 (timeout reached) +127.0.0.1102024/11/13 23:15:35 [WARN] memberlist: Refuting an alive message for '127.0.0.110' (127.0.0.110:42051) meta:([] VS []), vsn:([1 5 2 0 0 0] VS [1 5 2 0 0 0]) +127.0.0.1092024/11/13 23:15:35 [WARN] memberlist: Refuting an alive message for '127.0.0.109' (127.0.0.109:42051) meta:([] VS []), vsn:([1 5 2 0 0 0] VS [1 5 2 0 0 0]) +127.0.0.1082024/11/13 23:15:35 [INFO] memberlist: Suspect 127.0.0.112 has failed, no acks received +127.0.0.1082024/11/13 23:15:36 [INFO] memberlist: Marking 127.0.0.112 as failed, suspect timeout reached (0 peer confirmations) === RUN TestMemberList_ProbeNode_Suspect_Dogpile/n=6,_k=3 -127.0.0.1132025/12/17 05:32:44 [DEBUG] memberlist: Using dynamic bind port 33211 -127.0.0.1132025/12/17 05:32:44 [DEBUG] memberlist: Failed UDP ping: 127.0.0.118 (timeout reached) -127.0.0.1152025/12/17 05:32:44 [WARN] memberlist: Refuting an alive message for '127.0.0.115' (127.0.0.115:33211) meta:([] VS []), vsn:([1 5 2 0 0 0] VS [1 5 2 0 0 0]) -127.0.0.1172025/12/17 05:32:44 [WARN] memberlist: Refuting an alive message for '127.0.0.117' (127.0.0.117:33211) meta:([] VS []), vsn:([1 5 2 0 0 0] VS [1 5 2 0 0 0]) -127.0.0.1162025/12/17 05:32:44 [WARN] memberlist: Refuting an alive message for '127.0.0.116' (127.0.0.116:33211) meta:([] VS []), vsn:([1 5 2 0 0 0] VS [1 5 2 0 0 0]) -127.0.0.1132025/12/17 05:32:44 [INFO] memberlist: Suspect 127.0.0.118 has failed, no acks received -127.0.0.1132025/12/17 05:32:45 [INFO] memberlist: Marking 127.0.0.118 as failed, suspect timeout reached (0 peer confirmations) +127.0.0.1132024/11/13 23:15:36 [DEBUG] memberlist: Using dynamic bind port 41779 +127.0.0.1132024/11/13 23:15:36 [DEBUG] memberlist: Failed UDP ping: 127.0.0.118 (timeout reached) +127.0.0.1152024/11/13 23:15:36 [WARN] memberlist: Refuting an alive message for '127.0.0.115' (127.0.0.115:41779) meta:([] VS []), vsn:([1 5 2 0 0 0] VS [1 5 2 0 0 0]) +127.0.0.1162024/11/13 23:15:36 [WARN] memberlist: Refuting an alive message for '127.0.0.116' (127.0.0.116:41779) meta:([] VS []), vsn:([1 5 2 0 0 0] VS [1 5 2 0 0 0]) +127.0.0.1142024/11/13 23:15:36 [WARN] memberlist: Refuting an alive message for '127.0.0.114' (127.0.0.114:41779) meta:([] VS []), vsn:([1 5 2 0 0 0] VS [1 5 2 0 0 0]) +127.0.0.1132024/11/13 23:15:36 [INFO] memberlist: Suspect 127.0.0.118 has failed, no acks received +127.0.0.1132024/11/13 23:15:37 [INFO] memberlist: Marking 127.0.0.118 as failed, suspect timeout reached (0 peer confirmations) === RUN TestMemberList_ProbeNode_Suspect_Dogpile/n=6,_k=3_(confirmations_start_to_lower_timeout) -127.0.0.1192025/12/17 05:32:45 [DEBUG] memberlist: Using dynamic bind port 33655 -127.0.0.1192025/12/17 05:32:45 [DEBUG] memberlist: Failed UDP ping: 127.0.0.124 (timeout reached) -127.0.0.1202025/12/17 05:32:45 [WARN] memberlist: Refuting an alive message for '127.0.0.120' (127.0.0.120:33655) meta:([] VS []), vsn:([1 5 2 0 0 0] VS [1 5 2 0 0 0]) -127.0.0.1222025/12/17 05:32:45 [WARN] memberlist: Refuting an alive message for '127.0.0.122' (127.0.0.122:33655) meta:([] VS []), vsn:([1 5 2 0 0 0] VS [1 5 2 0 0 0]) -127.0.0.1232025/12/17 05:32:45 [WARN] memberlist: Refuting an alive message for '127.0.0.123' (127.0.0.123:33655) meta:([] VS []), vsn:([1 5 2 0 0 0] VS [1 5 2 0 0 0]) -127.0.0.1192025/12/17 05:32:45 [INFO] memberlist: Suspect 127.0.0.124 has failed, no acks received -127.0.0.1192025/12/17 05:32:46 [INFO] memberlist: Marking 127.0.0.124 as failed, suspect timeout reached (1 peer confirmations) +127.0.0.1192024/11/13 23:15:37 [DEBUG] memberlist: Using dynamic bind port 37143 +127.0.0.1192024/11/13 23:15:37 [DEBUG] memberlist: Failed UDP ping: 127.0.0.124 (timeout reached) +127.0.0.1202024/11/13 23:15:37 [WARN] memberlist: Refuting an alive message for '127.0.0.120' (127.0.0.120:37143) meta:([] VS []), vsn:([1 5 2 0 0 0] VS [1 5 2 0 0 0]) +127.0.0.1212024/11/13 23:15:37 [WARN] memberlist: Refuting an alive message for '127.0.0.121' (127.0.0.121:37143) meta:([] VS []), vsn:([1 5 2 0 0 0] VS [1 5 2 0 0 0]) +127.0.0.1232024/11/13 23:15:37 [WARN] memberlist: Refuting an alive message for '127.0.0.123' (127.0.0.123:37143) meta:([] VS []), vsn:([1 5 2 0 0 0] VS [1 5 2 0 0 0]) +127.0.0.1192024/11/13 23:15:38 [INFO] memberlist: Suspect 127.0.0.124 has failed, no acks received +127.0.0.1192024/11/13 23:15:38 [INFO] memberlist: Marking 127.0.0.124 as failed, suspect timeout reached (1 peer confirmations) === RUN TestMemberList_ProbeNode_Suspect_Dogpile/n=6,_k=3#01 -127.0.0.1252025/12/17 05:32:46 [DEBUG] memberlist: Using dynamic bind port 37573 -127.0.0.1252025/12/17 05:32:46 [DEBUG] memberlist: Failed UDP ping: 127.0.0.130 (timeout reached) -127.0.0.1292025/12/17 05:32:46 [WARN] memberlist: Refuting an alive message for '127.0.0.129' (127.0.0.129:37573) meta:([] VS []), vsn:([1 5 2 0 0 0] VS [1 5 2 0 0 0]) -127.0.0.1272025/12/17 05:32:46 [WARN] memberlist: Refuting an alive message for '127.0.0.127' (127.0.0.127:37573) meta:([] VS []), vsn:([1 5 2 0 0 0] VS [1 5 2 0 0 0]) -127.0.0.1262025/12/17 05:32:46 [WARN] memberlist: Refuting an alive message for '127.0.0.126' (127.0.0.126:37573) meta:([] VS []), vsn:([1 5 2 0 0 0] VS [1 5 2 0 0 0]) -127.0.0.1252025/12/17 05:32:46 [INFO] memberlist: Suspect 127.0.0.130 has failed, no acks received -127.0.0.1252025/12/17 05:32:47 [INFO] memberlist: Marking 127.0.0.130 as failed, suspect timeout reached (2 peer confirmations) +127.0.0.1252024/11/13 23:15:38 [DEBUG] memberlist: Using dynamic bind port 33101 +127.0.0.1252024/11/13 23:15:38 [DEBUG] memberlist: Failed UDP ping: 127.0.0.130 (timeout reached) +127.0.0.1262024/11/13 23:15:38 [WARN] memberlist: Refuting an alive message for '127.0.0.126' (127.0.0.126:33101) meta:([] VS []), vsn:([1 5 2 0 0 0] VS [1 5 2 0 0 0]) +127.0.0.1282024/11/13 23:15:38 [WARN] memberlist: Refuting an alive message for '127.0.0.128' (127.0.0.128:33101) meta:([] VS []), vsn:([1 5 2 0 0 0] VS [1 5 2 0 0 0]) +127.0.0.1292024/11/13 23:15:38 [WARN] memberlist: Refuting an alive message for '127.0.0.129' (127.0.0.129:33101) meta:([] VS []), vsn:([1 5 2 0 0 0] VS [1 5 2 0 0 0]) +127.0.0.1252024/11/13 23:15:38 [INFO] memberlist: Suspect 127.0.0.130 has failed, no acks received +127.0.0.1252024/11/13 23:15:39 [INFO] memberlist: Marking 127.0.0.130 as failed, suspect timeout reached (2 peer confirmations) === RUN TestMemberList_ProbeNode_Suspect_Dogpile/n=6,_k=3_(timeout_driven_to_nominal_value) -127.0.0.1312025/12/17 05:32:47 [DEBUG] memberlist: Using dynamic bind port 37503 -127.0.0.1312025/12/17 05:32:47 [DEBUG] memberlist: Failed UDP ping: 127.0.0.136 (timeout reached) -127.0.0.1322025/12/17 05:32:47 [WARN] memberlist: Refuting an alive message for '127.0.0.132' (127.0.0.132:37503) meta:([] VS []), vsn:([1 5 2 0 0 0] VS [1 5 2 0 0 0]) -127.0.0.1332025/12/17 05:32:47 [WARN] memberlist: Refuting an alive message for '127.0.0.133' (127.0.0.133:37503) meta:([] VS []), vsn:([1 5 2 0 0 0] VS [1 5 2 0 0 0]) -127.0.0.1352025/12/17 05:32:47 [WARN] memberlist: Refuting an alive message for '127.0.0.135' (127.0.0.135:37503) meta:([] VS []), vsn:([1 5 2 0 0 0] VS [1 5 2 0 0 0]) -127.0.0.1312025/12/17 05:32:47 [INFO] memberlist: Suspect 127.0.0.136 has failed, no acks received -127.0.0.1312025/12/17 05:32:47 [INFO] memberlist: Marking 127.0.0.136 as failed, suspect timeout reached (3 peer confirmations) +127.0.0.1312024/11/13 23:15:39 [DEBUG] memberlist: Using dynamic bind port 36299 +127.0.0.1312024/11/13 23:15:39 [DEBUG] memberlist: Failed UDP ping: 127.0.0.136 (timeout reached) +127.0.0.1352024/11/13 23:15:39 [WARN] memberlist: Refuting an alive message for '127.0.0.135' (127.0.0.135:36299) meta:([] VS []), vsn:([1 5 2 0 0 0] VS [1 5 2 0 0 0]) +127.0.0.1332024/11/13 23:15:39 [WARN] memberlist: Refuting an alive message for '127.0.0.133' (127.0.0.133:36299) meta:([] VS []), vsn:([1 5 2 0 0 0] VS [1 5 2 0 0 0]) +127.0.0.1342024/11/13 23:15:39 [WARN] memberlist: Refuting an alive message for '127.0.0.134' (127.0.0.134:36299) meta:([] VS []), vsn:([1 5 2 0 0 0] VS [1 5 2 0 0 0]) +127.0.0.1312024/11/13 23:15:39 [INFO] memberlist: Suspect 127.0.0.136 has failed, no acks received +127.0.0.1312024/11/13 23:15:40 [INFO] memberlist: Marking 127.0.0.136 as failed, suspect timeout reached (3 peer confirmations) === RUN TestMemberList_ProbeNode_Suspect_Dogpile/n=6,_k=3#02 -127.0.0.1372025/12/17 05:32:47 [DEBUG] memberlist: Using dynamic bind port 46211 -127.0.0.1372025/12/17 05:32:47 [DEBUG] memberlist: Failed UDP ping: 127.0.0.142 (timeout reached) -127.0.0.1382025/12/17 05:32:47 [WARN] memberlist: Refuting an alive message for '127.0.0.138' (127.0.0.138:46211) meta:([] VS []), vsn:([1 5 2 0 0 0] VS [1 5 2 0 0 0]) -127.0.0.1392025/12/17 05:32:47 [WARN] memberlist: Refuting an alive message for '127.0.0.139' (127.0.0.139:46211) meta:([] VS []), vsn:([1 5 2 0 0 0] VS [1 5 2 0 0 0]) -127.0.0.1412025/12/17 05:32:47 [WARN] memberlist: Refuting an alive message for '127.0.0.141' (127.0.0.141:46211) meta:([] VS []), vsn:([1 5 2 0 0 0] VS [1 5 2 0 0 0]) -127.0.0.1372025/12/17 05:32:47 [INFO] memberlist: Suspect 127.0.0.142 has failed, no acks received -127.0.0.1372025/12/17 05:32:48 [INFO] memberlist: Marking 127.0.0.142 as failed, suspect timeout reached (3 peer confirmations) +127.0.0.1372024/11/13 23:15:40 [DEBUG] memberlist: Using dynamic bind port 35409 +127.0.0.1372024/11/13 23:15:40 [DEBUG] memberlist: Failed UDP ping: 127.0.0.142 (timeout reached) +127.0.0.1412024/11/13 23:15:40 [WARN] memberlist: Refuting an alive message for '127.0.0.141' (127.0.0.141:35409) meta:([] VS []), vsn:([1 5 2 0 0 0] VS [1 5 2 0 0 0]) +127.0.0.1402024/11/13 23:15:40 [WARN] memberlist: Refuting an alive message for '127.0.0.140' (127.0.0.140:35409) meta:([] VS []), vsn:([1 5 2 0 0 0] VS [1 5 2 0 0 0]) +127.0.0.1382024/11/13 23:15:40 [WARN] memberlist: Refuting an alive message for '127.0.0.138' (127.0.0.138:35409) meta:([] VS []), vsn:([1 5 2 0 0 0] VS [1 5 2 0 0 0]) +127.0.0.1372024/11/13 23:15:40 [INFO] memberlist: Suspect 127.0.0.142 has failed, no acks received +127.0.0.1372024/11/13 23:15:40 [INFO] memberlist: Marking 127.0.0.142 as failed, suspect timeout reached (3 peer confirmations) --- PASS: TestMemberList_ProbeNode_Suspect_Dogpile (7.00s) --- PASS: TestMemberList_ProbeNode_Suspect_Dogpile/n=2,_k=3_(max_timeout_disabled) (0.63s) --- PASS: TestMemberList_ProbeNode_Suspect_Dogpile/n=3,_k=3 (0.63s) @@ -1511,47 +1546,47 @@ --- PASS: TestMemberList_ProbeNode_Suspect_Dogpile/n=6,_k=3_(timeout_driven_to_nominal_value) (0.63s) --- PASS: TestMemberList_ProbeNode_Suspect_Dogpile/n=6,_k=3#02 (0.63s) === RUN TestMemberList_ProbeNode_Awareness_Degraded -127.0.0.1432025/12/17 05:32:48 [DEBUG] memberlist: Using dynamic bind port 43791 -127.0.0.1432025/12/17 05:32:48 [DEBUG] memberlist: Failed UDP ping: 127.0.0.146 (timeout reached) -127.0.0.1452025/12/17 05:32:48 [WARN] memberlist: Refuting an alive message for '127.0.0.145' (127.0.0.145:43791) meta:([] VS []), vsn:([1 5 2 0 0 0] VS [1 5 2 0 0 0]) -127.0.0.1442025/12/17 05:32:48 [WARN] memberlist: Refuting an alive message for '127.0.0.144' (127.0.0.144:43791) meta:([] VS []), vsn:([1 5 2 0 0 0] VS [1 5 2 0 0 0]) -127.0.0.1432025/12/17 05:32:48 [INFO] memberlist: Suspect 127.0.0.146 has failed, no acks received +127.0.0.1432024/11/13 23:15:40 [DEBUG] memberlist: Using dynamic bind port 35203 +127.0.0.1432024/11/13 23:15:40 [DEBUG] memberlist: Failed UDP ping: 127.0.0.146 (timeout reached) +127.0.0.1442024/11/13 23:15:40 [WARN] memberlist: Refuting an alive message for '127.0.0.144' (127.0.0.144:35203) meta:([] VS []), vsn:([1 5 2 0 0 0] VS [1 5 2 0 0 0]) +127.0.0.1452024/11/13 23:15:40 [WARN] memberlist: Refuting an alive message for '127.0.0.145' (127.0.0.145:35203) meta:([] VS []), vsn:([1 5 2 0 0 0] VS [1 5 2 0 0 0]) +127.0.0.1432024/11/13 23:15:41 [INFO] memberlist: Suspect 127.0.0.146 has failed, no acks received --- PASS: TestMemberList_ProbeNode_Awareness_Degraded (0.40s) === RUN TestMemberList_ProbeNode_Wrong_VSN -127.0.0.1472025/12/17 05:32:48 [DEBUG] memberlist: Using dynamic bind port 38015 -127.0.0.1472025/12/17 05:32:48 [WARN] memberlist: Ignoring an alive message for '127.0.0.150' (127.0.0.150:38015) because protocol version(s) are wrong: 0 <= 0 <= 0 should be >0 +127.0.0.1472024/11/13 23:15:41 [DEBUG] memberlist: Using dynamic bind port 40129 +127.0.0.1472024/11/13 23:15:41 [WARN] memberlist: Ignoring an alive message for '127.0.0.150' (127.0.0.150:40129) because protocol version(s) are wrong: 0 <= 0 <= 0 should be >0 --- PASS: TestMemberList_ProbeNode_Wrong_VSN (0.00s) === RUN TestMemberList_ProbeNode_Awareness_Improved -127.0.0.1512025/12/17 05:32:48 [DEBUG] memberlist: Using dynamic bind port 35647 +127.0.0.1512024/11/13 23:15:41 [DEBUG] memberlist: Using dynamic bind port 46803 +127.0.0.1522024/11/13 23:15:41 [WARN] memberlist: Refuting an alive message for '127.0.0.152' (127.0.0.152:46803) meta:([] VS []), vsn:([1 5 2 0 0 0] VS [1 5 2 0 0 0]) --- PASS: TestMemberList_ProbeNode_Awareness_Improved (0.00s) === RUN TestMemberList_ProbeNode_Awareness_MissedNack -127.0.0.1522025/12/17 05:32:48 [WARN] memberlist: Refuting an alive message for '127.0.0.152' (127.0.0.152:35647) meta:([] VS []), vsn:([1 5 2 0 0 0] VS [1 5 2 0 0 0]) -127.0.0.1532025/12/17 05:32:48 [DEBUG] memberlist: Using dynamic bind port 34753 -127.0.0.1532025/12/17 05:32:48 [DEBUG] memberlist: Failed UDP ping: 127.0.0.156 (timeout reached) -127.0.0.1542025/12/17 05:32:48 [WARN] memberlist: Refuting an alive message for '127.0.0.154' (127.0.0.154:34753) meta:([] VS []), vsn:([1 5 2 0 0 0] VS [1 5 2 0 0 0]) -127.0.0.1532025/12/17 05:32:49 [INFO] memberlist: Suspect 127.0.0.156 has failed, no acks received +127.0.0.1532024/11/13 23:15:41 [DEBUG] memberlist: Using dynamic bind port 46357 +127.0.0.1532024/11/13 23:15:41 [DEBUG] memberlist: Failed UDP ping: 127.0.0.156 (timeout reached) +127.0.0.1542024/11/13 23:15:41 [WARN] memberlist: Refuting an alive message for '127.0.0.154' (127.0.0.154:46357) meta:([] VS []), vsn:([1 5 2 0 0 0] VS [1 5 2 0 0 0]) +127.0.0.1532024/11/13 23:15:41 [INFO] memberlist: Suspect 127.0.0.156 has failed, no acks received --- PASS: TestMemberList_ProbeNode_Awareness_MissedNack (0.20s) === RUN TestMemberList_ProbeNode_Awareness_OldProtocol -127.0.0.1572025/12/17 05:32:49 [DEBUG] memberlist: Using dynamic bind port 44799 -127.0.0.1572025/12/17 05:32:49 [DEBUG] memberlist: Failed UDP ping: 127.0.0.160 (timeout reached) -127.0.0.1582025/12/17 05:32:49 [WARN] memberlist: Refuting an alive message for '127.0.0.158' (127.0.0.158:44799) meta:([] VS []), vsn:([] VS [0 0 0 0 0 0]) -127.0.0.1592025/12/17 05:32:49 [WARN] memberlist: Refuting an alive message for '127.0.0.159' (127.0.0.159:44799) meta:([] VS []), vsn:([] VS [0 0 0 0 0 0]) -127.0.0.1572025/12/17 05:32:49 [INFO] memberlist: Suspect 127.0.0.160 has failed, no acks received +127.0.0.1572024/11/13 23:15:41 [DEBUG] memberlist: Using dynamic bind port 36353 +127.0.0.1572024/11/13 23:15:41 [DEBUG] memberlist: Failed UDP ping: 127.0.0.160 (timeout reached) +127.0.0.1582024/11/13 23:15:41 [WARN] memberlist: Refuting an alive message for '127.0.0.158' (127.0.0.158:36353) meta:([] VS []), vsn:([] VS [0 0 0 0 0 0]) +127.0.0.1592024/11/13 23:15:41 [WARN] memberlist: Refuting an alive message for '127.0.0.159' (127.0.0.159:36353) meta:([] VS []), vsn:([] VS [0 0 0 0 0 0]) +127.0.0.1572024/11/13 23:15:41 [INFO] memberlist: Suspect 127.0.0.160 has failed, no acks received --- PASS: TestMemberList_ProbeNode_Awareness_OldProtocol (0.42s) === RUN TestMemberList_ProbeNode_Buddy -127.0.0.1612025/12/17 05:32:49 [DEBUG] memberlist: Using dynamic bind port 44627 -127.0.0.1622025/12/17 05:32:49 [WARN] memberlist: Refuting a suspect message (from: 127.0.0.161) +127.0.0.1612024/11/13 23:15:41 [DEBUG] memberlist: Using dynamic bind port 44687 +127.0.0.1622024/11/13 23:15:41 [WARN] memberlist: Refuting a suspect message (from: 127.0.0.161) --- PASS: TestMemberList_ProbeNode_Buddy (0.00s) === RUN TestMemberList_ProbeNode -127.0.0.1632025/12/17 05:32:49 [DEBUG] memberlist: Using dynamic bind port 43173 -127.0.0.1642025/12/17 05:32:49 [WARN] memberlist: Refuting an alive message for '127.0.0.164' (127.0.0.164:43173) meta:([] VS []), vsn:([] VS [0 0 0 0 0 0]) +127.0.0.1632024/11/13 23:15:41 [DEBUG] memberlist: Using dynamic bind port 40357 +127.0.0.1642024/11/13 23:15:41 [WARN] memberlist: Refuting an alive message for '127.0.0.164' (127.0.0.164:40357) meta:([] VS []), vsn:([] VS [0 0 0 0 0 0]) --- PASS: TestMemberList_ProbeNode (0.00s) === RUN TestMemberList_Ping state_test.go:978: Skip randomly failing test --- SKIP: TestMemberList_Ping (0.00s) === RUN TestMemberList_ResetNodes -127.0.0.1652025/12/17 05:32:49 [DEBUG] memberlist: Using dynamic bind port 34307 ---- PASS: TestMemberList_ResetNodes (0.20s) +127.0.0.1652024/11/13 23:15:41 [DEBUG] memberlist: Using dynamic bind port 43813 +--- PASS: TestMemberList_ResetNodes (0.21s) === RUN TestMemberList_NextSeq --- PASS: TestMemberList_NextSeq (0.00s) === RUN TestMemberList_setProbeChannels @@ -1565,77 +1600,77 @@ === RUN TestMemberList_invokeAckHandler_Channel_Nack --- PASS: TestMemberList_invokeAckHandler_Channel_Nack (0.00s) === RUN TestMemberList_AliveNode_NewNode -127.0.0.1662025/12/17 05:32:49 [DEBUG] memberlist: Using dynamic bind port 41401 +127.0.0.1662024/11/13 23:15:42 [DEBUG] memberlist: Using dynamic bind port 42955 --- PASS: TestMemberList_AliveNode_NewNode (0.00s) === RUN TestMemberList_AliveNode_SuspectNode -127.0.0.1672025/12/17 05:32:49 [DEBUG] memberlist: Using dynamic bind port 44125 +127.0.0.1672024/11/13 23:15:42 [DEBUG] memberlist: Using dynamic bind port 42151 --- PASS: TestMemberList_AliveNode_SuspectNode (0.00s) === RUN TestMemberList_AliveNode_Idempotent -127.0.0.1682025/12/17 05:32:49 [DEBUG] memberlist: Using dynamic bind port 40105 +127.0.0.1682024/11/13 23:15:42 [DEBUG] memberlist: Using dynamic bind port 43149 --- PASS: TestMemberList_AliveNode_Idempotent (0.00s) === RUN TestMemberList_AliveNode_ChangeMeta -127.0.0.1692025/12/17 05:32:49 [DEBUG] memberlist: Using dynamic bind port 33911 +127.0.0.1692024/11/13 23:15:42 [DEBUG] memberlist: Using dynamic bind port 46189 --- PASS: TestMemberList_AliveNode_ChangeMeta (0.00s) === RUN TestMemberList_AliveNode_Refute -127.0.0.1702025/12/17 05:32:49 [DEBUG] memberlist: Using dynamic bind port 36903 -127.0.0.1702025/12/17 05:32:49 [WARN] memberlist: Refuting an alive message for '127.0.0.170' (127.0.0.1:0) meta:([102 111 111] VS []), vsn:([1 5 2 0 0 0] VS [1 5 2 0 0 0]) +127.0.0.1702024/11/13 23:15:42 [DEBUG] memberlist: Using dynamic bind port 46149 +127.0.0.1702024/11/13 23:15:42 [WARN] memberlist: Refuting an alive message for '127.0.0.170' (127.0.0.1:0) meta:([102 111 111] VS []), vsn:([1 5 2 0 0 0] VS [1 5 2 0 0 0]) --- PASS: TestMemberList_AliveNode_Refute (0.00s) === RUN TestMemberList_AliveNode_Conflict -127.0.0.1712025/12/17 05:32:49 [DEBUG] memberlist: Using dynamic bind port 33681 -127.0.0.1712025/12/17 05:32:49 [ERR] memberlist: Conflicting address for test. Mine: 127.0.0.1:8000 Theirs: 127.0.0.2:9000 Old state: 0 -127.0.0.1712025/12/17 05:32:49 [INFO] memberlist: Updating address for left or failed node test from 127.0.0.1:8000 to 127.0.0.2:9000 +127.0.0.1712024/11/13 23:15:42 [DEBUG] memberlist: Using dynamic bind port 44567 +127.0.0.1712024/11/13 23:15:42 [ERR] memberlist: Conflicting address for test. Mine: 127.0.0.1:8000 Theirs: 127.0.0.2:9000 Old state: 0 +127.0.0.1712024/11/13 23:15:42 [INFO] memberlist: Updating address for left or failed node test from 127.0.0.1:8000 to 127.0.0.2:9000 --- PASS: TestMemberList_AliveNode_Conflict (0.01s) === RUN TestMemberList_SuspectNode_NoNode -127.0.0.1722025/12/17 05:32:49 [DEBUG] memberlist: Using dynamic bind port 38287 +127.0.0.1722024/11/13 23:15:42 [DEBUG] memberlist: Using dynamic bind port 39807 --- PASS: TestMemberList_SuspectNode_NoNode (0.00s) === RUN TestMemberList_SuspectNode -127.0.0.1732025/12/17 05:32:49 [DEBUG] memberlist: Using dynamic bind port 32879 -127.0.0.1732025/12/17 05:32:49 [INFO] memberlist: Marking test as failed, suspect timeout reached (0 peer confirmations) +127.0.0.1732024/11/13 23:15:42 [DEBUG] memberlist: Using dynamic bind port 46791 +127.0.0.1732024/11/13 23:15:42 [INFO] memberlist: Marking test as failed, suspect timeout reached (0 peer confirmations) --- PASS: TestMemberList_SuspectNode (0.01s) === RUN TestMemberList_SuspectNode_DoubleSuspect -127.0.0.1742025/12/17 05:32:49 [DEBUG] memberlist: Using dynamic bind port 37629 +127.0.0.1742024/11/13 23:15:42 [DEBUG] memberlist: Using dynamic bind port 38637 --- PASS: TestMemberList_SuspectNode_DoubleSuspect (0.00s) === RUN TestMemberList_SuspectNode_OldSuspect -127.0.0.1752025/12/17 05:32:49 [DEBUG] memberlist: Using dynamic bind port 41603 +127.0.0.1752024/11/13 23:15:42 [DEBUG] memberlist: Using dynamic bind port 37885 --- PASS: TestMemberList_SuspectNode_OldSuspect (0.00s) === RUN TestMemberList_SuspectNode_Refute -127.0.0.1762025/12/17 05:32:49 [DEBUG] memberlist: Using dynamic bind port 46095 -127.0.0.1762025/12/17 05:32:49 [WARN] memberlist: Refuting a suspect message (from: ) +127.0.0.1762024/11/13 23:15:42 [DEBUG] memberlist: Using dynamic bind port 38491 +127.0.0.1762024/11/13 23:15:42 [WARN] memberlist: Refuting a suspect message (from: ) --- PASS: TestMemberList_SuspectNode_Refute (0.00s) === RUN TestMemberList_DeadNode_NoNode -127.0.0.1772025/12/17 05:32:49 [DEBUG] memberlist: Using dynamic bind port 37299 +127.0.0.1772024/11/13 23:15:42 [DEBUG] memberlist: Using dynamic bind port 44219 --- PASS: TestMemberList_DeadNode_NoNode (0.00s) === RUN TestMemberList_DeadNodeLeft -127.0.0.1782025/12/17 05:32:49 [DEBUG] memberlist: Using dynamic bind port 43435 -127.0.0.1782025/12/17 05:32:49 [INFO] memberlist: Updating address for left or failed node node1 from 127.0.0.1:8000 to 127.0.0.2:9000 +127.0.0.1782024/11/13 23:15:42 [DEBUG] memberlist: Using dynamic bind port 32833 +127.0.0.1782024/11/13 23:15:42 [INFO] memberlist: Updating address for left or failed node node1 from 127.0.0.1:8000 to 127.0.0.2:9000 --- PASS: TestMemberList_DeadNodeLeft (0.00s) === RUN TestMemberList_DeadNode -127.0.0.1792025/12/17 05:32:49 [DEBUG] memberlist: Using dynamic bind port 45727 +127.0.0.1792024/11/13 23:15:42 [DEBUG] memberlist: Using dynamic bind port 33047 --- PASS: TestMemberList_DeadNode (0.00s) === RUN TestMemberList_DeadNode_Double -127.0.0.1802025/12/17 05:32:49 [DEBUG] memberlist: Using dynamic bind port 38551 +127.0.0.1802024/11/13 23:15:42 [DEBUG] memberlist: Using dynamic bind port 39683 --- PASS: TestMemberList_DeadNode_Double (0.00s) === RUN TestMemberList_DeadNode_OldDead -127.0.0.1812025/12/17 05:32:49 [DEBUG] memberlist: Using dynamic bind port 45667 +127.0.0.1812024/11/13 23:15:42 [DEBUG] memberlist: Using dynamic bind port 37297 --- PASS: TestMemberList_DeadNode_OldDead (0.00s) === RUN TestMemberList_DeadNode_AliveReplay -127.0.0.1822025/12/17 05:32:49 [DEBUG] memberlist: Using dynamic bind port 41971 +127.0.0.1822024/11/13 23:15:42 [DEBUG] memberlist: Using dynamic bind port 35129 --- PASS: TestMemberList_DeadNode_AliveReplay (0.00s) === RUN TestMemberList_DeadNode_Refute -127.0.0.1832025/12/17 05:32:49 [DEBUG] memberlist: Using dynamic bind port 41019 -127.0.0.1832025/12/17 05:32:49 [WARN] memberlist: Refuting a dead message (from: ) +127.0.0.1832024/11/13 23:15:42 [DEBUG] memberlist: Using dynamic bind port 39905 +127.0.0.1832024/11/13 23:15:42 [WARN] memberlist: Refuting a dead message (from: ) --- PASS: TestMemberList_DeadNode_Refute (0.00s) === RUN TestMemberList_MergeState -127.0.0.1842025/12/17 05:32:49 [DEBUG] memberlist: Using dynamic bind port 38159 +127.0.0.1842024/11/13 23:15:42 [DEBUG] memberlist: Using dynamic bind port 38511 --- PASS: TestMemberList_MergeState (0.00s) === RUN TestMemberlist_Gossip -127.0.0.1852025/12/17 05:32:49 [DEBUG] memberlist: Using dynamic bind port 33163 -127.0.0.1862025/12/17 05:32:49 [DEBUG] memberlist: Using dynamic bind port 42695 -127.0.0.1862025/12/17 05:32:49 [WARN] memberlist: Refuting an alive message for '127.0.0.186' (127.0.0.186:33163) meta:([] VS []), vsn:([1 5 2 0 0 0] VS [1 5 2 0 0 0]) ---- PASS: TestMemberlist_Gossip (0.00s) +127.0.0.1852024/11/13 23:15:42 [DEBUG] memberlist: Using dynamic bind port 33767 +127.0.0.1862024/11/13 23:15:42 [DEBUG] memberlist: Using dynamic bind port 45779 +127.0.0.1862024/11/13 23:15:42 [WARN] memberlist: Refuting an alive message for '127.0.0.186' (127.0.0.186:33767) meta:([] VS []), vsn:([1 5 2 0 0 0] VS [1 5 2 0 0 0]) +--- PASS: TestMemberlist_Gossip (0.02s) === RUN TestMemberlist_GossipToDead -127.0.0.1882025/12/17 05:32:49 [DEBUG] memberlist: Using dynamic bind port 34649 -127.0.0.1892025/12/17 05:32:49 [WARN] memberlist: Refuting an alive message for '127.0.0.189' (127.0.0.189:34649) meta:([] VS []), vsn:([1 5 2 0 0 0] VS [1 5 2 0 0 0]) +127.0.0.1882024/11/13 23:15:42 [DEBUG] memberlist: Using dynamic bind port 43401 +127.0.0.1892024/11/13 23:15:42 [WARN] memberlist: Refuting an alive message for '127.0.0.189' (127.0.0.189:43401) meta:([] VS []), vsn:([1 5 2 0 0 0] VS [1 5 2 0 0 0]) --- PASS: TestMemberlist_GossipToDead (0.05s) === RUN TestMemberlist_FailedRemote === RUN TestMemberlist_FailedRemote/nil_error @@ -1668,81 +1703,81 @@ --- PASS: TestMemberlist_FailedRemote/net.OpError_for_udp_with_write (0.00s) --- PASS: TestMemberlist_FailedRemote/net.OpError_for_udp_with_read (0.00s) === RUN TestMemberlist_PushPull -127.0.0.1902025/12/17 05:32:49 [DEBUG] memberlist: Using dynamic bind port 45449 -127.0.0.1902025/12/17 05:32:49 [DEBUG] memberlist: Initiating push/pull sync with: 127.0.0.191 127.0.0.191:45449 -127.0.0.1912025/12/17 05:32:49 [DEBUG] memberlist: Stream connection from=127.0.0.1:37452 -127.0.0.1912025/12/17 05:32:49 [WARN] memberlist: Refuting an alive message for '127.0.0.191' (127.0.0.191:45449) meta:([] VS []), vsn:([1 5 2 0 0 0] VS [1 5 2 0 0 0]) ---- PASS: TestMemberlist_PushPull (0.00s) +127.0.0.1902024/11/13 23:15:42 [DEBUG] memberlist: Using dynamic bind port 35113 +127.0.0.1902024/11/13 23:15:42 [DEBUG] memberlist: Initiating push/pull sync with: 127.0.0.191 127.0.0.191:35113 +127.0.0.1912024/11/13 23:15:42 [DEBUG] memberlist: Stream connection from=127.0.0.1:60086 +127.0.0.1912024/11/13 23:15:42 [WARN] memberlist: Refuting an alive message for '127.0.0.191' (127.0.0.191:35113) meta:([] VS []), vsn:([1 5 2 0 0 0] VS [1 5 2 0 0 0]) +--- PASS: TestMemberlist_PushPull (0.01s) === RUN TestVerifyProtocol -127.0.0.1922025/12/17 05:32:49 [DEBUG] memberlist: Using dynamic bind port 37427 -127.0.0.1932025/12/17 05:32:49 [DEBUG] memberlist: Using dynamic bind port 35017 -127.0.0.1942025/12/17 05:32:49 [DEBUG] memberlist: Using dynamic bind port 43169 -127.0.0.1952025/12/17 05:32:49 [DEBUG] memberlist: Using dynamic bind port 36929 -127.0.0.1962025/12/17 05:32:49 [DEBUG] memberlist: Using dynamic bind port 33589 -127.0.0.1972025/12/17 05:32:49 [DEBUG] memberlist: Using dynamic bind port 43879 -127.0.0.1982025/12/17 05:32:49 [DEBUG] memberlist: Using dynamic bind port 35381 -127.0.0.1992025/12/17 05:32:49 [DEBUG] memberlist: Using dynamic bind port 40379 -127.0.0.2002025/12/17 05:32:49 [DEBUG] memberlist: Using dynamic bind port 37469 -127.0.0.2012025/12/17 05:32:49 [DEBUG] memberlist: Using dynamic bind port 45247 -127.0.0.2022025/12/17 05:32:49 [DEBUG] memberlist: Using dynamic bind port 41707 -127.0.0.2032025/12/17 05:32:49 [DEBUG] memberlist: Using dynamic bind port 36783 -127.0.0.2042025/12/17 05:32:49 [DEBUG] memberlist: Using dynamic bind port 42695 -127.0.0.2052025/12/17 05:32:49 [DEBUG] memberlist: Using dynamic bind port 35031 -127.0.0.2062025/12/17 05:32:49 [DEBUG] memberlist: Using dynamic bind port 36119 -127.0.0.2072025/12/17 05:32:49 [DEBUG] memberlist: Using dynamic bind port 40809 -127.0.0.2082025/12/17 05:32:49 [DEBUG] memberlist: Using dynamic bind port 45299 -127.0.0.2092025/12/17 05:32:49 [DEBUG] memberlist: Using dynamic bind port 46693 -127.0.0.2102025/12/17 05:32:49 [DEBUG] memberlist: Using dynamic bind port 43185 -127.0.0.2112025/12/17 05:32:49 [DEBUG] memberlist: Using dynamic bind port 37281 +127.0.0.1922024/11/13 23:15:42 [DEBUG] memberlist: Using dynamic bind port 44833 +127.0.0.1932024/11/13 23:15:42 [DEBUG] memberlist: Using dynamic bind port 35505 +127.0.0.1942024/11/13 23:15:42 [DEBUG] memberlist: Using dynamic bind port 33631 +127.0.0.1952024/11/13 23:15:42 [DEBUG] memberlist: Using dynamic bind port 39565 +127.0.0.1962024/11/13 23:15:42 [DEBUG] memberlist: Using dynamic bind port 41711 +127.0.0.1972024/11/13 23:15:42 [DEBUG] memberlist: Using dynamic bind port 35237 +127.0.0.1982024/11/13 23:15:42 [DEBUG] memberlist: Using dynamic bind port 37261 +127.0.0.1992024/11/13 23:15:42 [DEBUG] memberlist: Using dynamic bind port 38297 +127.0.0.2002024/11/13 23:15:42 [DEBUG] memberlist: Using dynamic bind port 40315 +127.0.0.2012024/11/13 23:15:42 [DEBUG] memberlist: Using dynamic bind port 46717 +127.0.0.2022024/11/13 23:15:42 [DEBUG] memberlist: Using dynamic bind port 33169 +127.0.0.2032024/11/13 23:15:42 [DEBUG] memberlist: Using dynamic bind port 40225 +127.0.0.2042024/11/13 23:15:42 [DEBUG] memberlist: Using dynamic bind port 38839 +127.0.0.2052024/11/13 23:15:42 [DEBUG] memberlist: Using dynamic bind port 38941 +127.0.0.2062024/11/13 23:15:42 [DEBUG] memberlist: Using dynamic bind port 35773 +127.0.0.2072024/11/13 23:15:42 [DEBUG] memberlist: Using dynamic bind port 36775 +127.0.0.2082024/11/13 23:15:42 [DEBUG] memberlist: Using dynamic bind port 42685 +127.0.0.2092024/11/13 23:15:42 [DEBUG] memberlist: Using dynamic bind port 39541 +127.0.0.2102024/11/13 23:15:42 [DEBUG] memberlist: Using dynamic bind port 36707 +127.0.0.2112024/11/13 23:15:42 [DEBUG] memberlist: Using dynamic bind port 40193 --- PASS: TestVerifyProtocol (0.00s) === RUN TestSuspicion_remainingSuspicionTime --- PASS: TestSuspicion_remainingSuspicionTime (0.00s) === RUN TestSuspicion_Timer -127.0.0.1432025/12/17 05:32:53 [INFO] memberlist: Marking 127.0.0.146 as failed, suspect timeout reached (0 peer confirmations) -127.0.0.1742025/12/17 05:32:53 [INFO] memberlist: Marking test as failed, suspect timeout reached (0 peer confirmations) -127.0.0.1842025/12/17 05:32:53 [INFO] memberlist: Marking test3 as failed, suspect timeout reached (0 peer confirmations) -127.0.0.1842025/12/17 05:32:53 [INFO] memberlist: Marking test2 as failed, suspect timeout reached (0 peer confirmations) -127.0.0.1532025/12/17 05:32:53 [INFO] memberlist: Marking 127.0.0.156 as failed, suspect timeout reached (0 peer confirmations) -127.0.0.1572025/12/17 05:32:54 [INFO] memberlist: Marking 127.0.0.160 as failed, suspect timeout reached (0 peer confirmations) ---- PASS: TestSuspicion_Timer (13.08s) +127.0.0.1432024/11/13 23:15:46 [INFO] memberlist: Marking 127.0.0.146 as failed, suspect timeout reached (0 peer confirmations) +127.0.0.1742024/11/13 23:15:46 [INFO] memberlist: Marking test as failed, suspect timeout reached (0 peer confirmations) +127.0.0.1842024/11/13 23:15:46 [INFO] memberlist: Marking test3 as failed, suspect timeout reached (0 peer confirmations) +127.0.0.1842024/11/13 23:15:46 [INFO] memberlist: Marking test2 as failed, suspect timeout reached (0 peer confirmations) +127.0.0.1532024/11/13 23:15:46 [INFO] memberlist: Marking 127.0.0.156 as failed, suspect timeout reached (0 peer confirmations) +127.0.0.1572024/11/13 23:15:46 [INFO] memberlist: Marking 127.0.0.160 as failed, suspect timeout reached (0 peer confirmations) +--- PASS: TestSuspicion_Timer (13.14s) === RUN TestSuspicion_Timer_ZeroK --- PASS: TestSuspicion_Timer_ZeroK (0.03s) === RUN TestSuspicion_Timer_Immediate --- PASS: TestSuspicion_Timer_Immediate (0.20s) === RUN TestTransport_Join -2025/12/17 05:33:03 [DEBUG] memberlist: Initiating push/pull sync with: node1 pipe -2025/12/17 05:33:03 [DEBUG] memberlist: Stream connection from=pipe +2024/11/13 23:15:55 [DEBUG] memberlist: Stream connection from=pipe +2024/11/13 23:15:55 [DEBUG] memberlist: Initiating push/pull sync with: node1 pipe --- PASS: TestTransport_Join (0.00s) === RUN TestTransport_Send -2025/12/17 05:33:03 [DEBUG] memberlist: Initiating push/pull sync with: node1 pipe -2025/12/17 05:33:03 [DEBUG] memberlist: Stream connection from=pipe -2025/12/17 05:33:03 [DEBUG] memberlist: Stream connection from=pipe -2025/12/17 05:33:03 [DEBUG] memberlist: Stream connection from=pipe ---- PASS: TestTransport_Send (0.10s) +2024/11/13 23:15:55 [DEBUG] memberlist: Initiating push/pull sync with: node1 pipe +2024/11/13 23:15:55 [DEBUG] memberlist: Stream connection from=pipe +2024/11/13 23:15:55 [DEBUG] memberlist: Stream connection from=pipe +2024/11/13 23:15:55 [DEBUG] memberlist: Stream connection from=pipe +--- PASS: TestTransport_Send (0.15s) === RUN TestTransport_TcpListenBackoff - transport_test.go:147: countingWriter: test2025/12/17 05:33:03 [ERR] memberlist: Error accepting TCP connection: accept tcp [::]:45009: use of closed network connection + transport_test.go:147: countingWriter: test2024/11/13 23:15:55 [ERR] memberlist: Error accepting TCP connection: accept tcp [::]:41965: use of closed network connection - transport_test.go:147: countingWriter: test2025/12/17 05:33:03 [ERR] memberlist: Error accepting TCP connection: accept tcp [::]:45009: use of closed network connection + transport_test.go:147: countingWriter: test2024/11/13 23:15:55 [ERR] memberlist: Error accepting TCP connection: accept tcp [::]:41965: use of closed network connection - transport_test.go:147: countingWriter: test2025/12/17 05:33:03 [ERR] memberlist: Error accepting TCP connection: accept tcp [::]:45009: use of closed network connection + transport_test.go:147: countingWriter: test2024/11/13 23:15:55 [ERR] memberlist: Error accepting TCP connection: accept tcp [::]:41965: use of closed network connection - transport_test.go:147: countingWriter: test2025/12/17 05:33:03 [ERR] memberlist: Error accepting TCP connection: accept tcp [::]:45009: use of closed network connection + transport_test.go:147: countingWriter: test2024/11/13 23:15:55 [ERR] memberlist: Error accepting TCP connection: accept tcp [::]:41965: use of closed network connection - transport_test.go:147: countingWriter: test2025/12/17 05:33:03 [ERR] memberlist: Error accepting TCP connection: accept tcp [::]:45009: use of closed network connection + transport_test.go:147: countingWriter: test2024/11/13 23:15:55 [ERR] memberlist: Error accepting TCP connection: accept tcp [::]:41965: use of closed network connection - transport_test.go:147: countingWriter: test2025/12/17 05:33:03 [ERR] memberlist: Error accepting TCP connection: accept tcp [::]:45009: use of closed network connection + transport_test.go:147: countingWriter: test2024/11/13 23:15:55 [ERR] memberlist: Error accepting TCP connection: accept tcp [::]:41965: use of closed network connection - transport_test.go:147: countingWriter: test2025/12/17 05:33:03 [ERR] memberlist: Error accepting TCP connection: accept tcp [::]:45009: use of closed network connection + transport_test.go:147: countingWriter: test2024/11/13 23:15:56 [ERR] memberlist: Error accepting TCP connection: accept tcp [::]:41965: use of closed network connection - transport_test.go:147: countingWriter: test2025/12/17 05:33:03 [ERR] memberlist: Error accepting TCP connection: accept tcp [::]:45009: use of closed network connection + transport_test.go:147: countingWriter: test2024/11/13 23:15:56 [ERR] memberlist: Error accepting TCP connection: accept tcp [::]:41965: use of closed network connection - transport_test.go:147: countingWriter: test2025/12/17 05:33:04 [ERR] memberlist: Error accepting TCP connection: accept tcp [::]:45009: use of closed network connection + transport_test.go:147: countingWriter: test2024/11/13 23:15:57 [ERR] memberlist: Error accepting TCP connection: accept tcp [::]:41965: use of closed network connection - transport_test.go:147: countingWriter: test2025/12/17 05:33:05 [ERR] memberlist: Error accepting TCP connection: accept tcp [::]:45009: use of closed network connection + transport_test.go:147: countingWriter: test2024/11/13 23:15:58 [ERR] memberlist: Error accepting TCP connection: accept tcp [::]:41965: use of closed network connection - transport_test.go:147: countingWriter: test2025/12/17 05:33:06 [ERR] memberlist: Error accepting TCP connection: accept tcp [::]:45009: use of closed network connection + transport_test.go:147: countingWriter: test2024/11/13 23:15:59 [ERR] memberlist: Error accepting TCP connection: accept tcp [::]:41965: use of closed network connection ---- PASS: TestTransport_TcpListenBackoff (4.28s) +--- PASS: TestTransport_TcpListenBackoff (4.32s) === RUN TestUtil_PortFunctions === RUN TestUtil_PortFunctions/1.2.3.4 === RUN TestUtil_PortFunctions/1.2.3.4:1234 @@ -1803,7 +1838,7 @@ --- PASS: Test_IsValidAddressOverride/Only_IPv6 (0.00s) --- PASS: Test_IsValidAddressOverride/Only_127.0.0.0/8_and_::1 (0.00s) PASS -ok github.com/hashicorp/memberlist 37.995s +ok github.com/hashicorp/memberlist 38.764s === RUN TestRetryer === RUN TestRetryer/counter === RUN TestRetryer/timer @@ -1811,7 +1846,7 @@ --- PASS: TestRetryer/counter (0.20s) --- PASS: TestRetryer/timer (0.20s) PASS -ok github.com/hashicorp/memberlist/internal/retry 0.406s +ok github.com/hashicorp/memberlist/internal/retry 0.651s create-stamp debian/debhelper-build-stamp dh_testroot -O--buildsystem=golang dh_prep -O--buildsystem=golang @@ -1838,12 +1873,14 @@ dpkg-buildpackage: info: binary-only upload (no source included) dpkg-genchanges: info: including full source code in upload I: copying local configuration +I: user script /srv/workspace/pbuilder/1663607/tmp/hooks/B01_cleanup starting +I: user script /srv/workspace/pbuilder/1663607/tmp/hooks/B01_cleanup finished I: unmounting dev/ptmx filesystem I: unmounting dev/pts filesystem I: unmounting dev/shm filesystem I: unmounting proc filesystem I: unmounting sys filesystem I: cleaning the build env -I: removing directory /srv/workspace/pbuilder/3722843 and its subdirectories -I: Current time: Tue Dec 16 17:33:11 -12 2025 -I: pbuilder-time-stamp: 1765949591 +I: removing directory /srv/workspace/pbuilder/1663607 and its subdirectories +I: Current time: Thu Nov 14 13:16:33 +14 2024 +I: pbuilder-time-stamp: 1731539793