Diff of the two buildlogs: -- --- b1/build.log 2024-05-09 21:06:04.132697707 +0000 +++ b2/build.log 2024-05-09 21:11:26.002998850 +0000 @@ -1,6 +1,6 @@ I: pbuilder: network access will be disabled during build -I: Current time: Thu May 9 09:00:36 -12 2024 -I: pbuilder-time-stamp: 1715288436 +I: Current time: Thu Jun 12 17:29:08 +14 2025 +I: pbuilder-time-stamp: 1749698948 I: Building the build Environment I: extracting base tarball [/var/cache/pbuilder/trixie-reproducible-base.tgz] I: copying local configuration @@ -25,52 +25,84 @@ dpkg-source: info: unpacking garagemq_0.0~git20200204.15e6a9d+ds-4.debian.tar.xz I: using fakeroot in build. I: Installing the build-deps -I: user script /srv/workspace/pbuilder/2456589/tmp/hooks/D02_print_environment starting +I: user script /srv/workspace/pbuilder/3281343/tmp/hooks/D01_modify_environment starting +debug: Running on ionos15-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 Jun 12 03:29 /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/3281343/tmp/hooks/D01_modify_environment finished +I: user script /srv/workspace/pbuilder/3281343/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=20 ' - 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]="21" [3]="1" [4]="release" [5]="x86_64-pc-linux-gnu") + BASH_VERSION='5.2.21(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=42 ' + 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='07e6c1a5ee23405c880b25ad66df8b79' - 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='2456589' - PS1='# ' - PS2='> ' + INVOCATION_ID=ce42f5c0a3084f63b0ae79659d19dd7d + 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=3281343 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.p9P36PRC/pbuilderrc_bn8u --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.p9P36PRC/b1 --logfile b1/build.log garagemq_0.0~git20200204.15e6a9d+ds-4.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://46.16.76.132: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.p9P36PRC/pbuilderrc_56vH --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.p9P36PRC/b2 --logfile b2/build.log garagemq_0.0~git20200204.15e6a9d+ds-4.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://213.165.73.152:3128 I: uname -a - Linux ionos11-amd64 6.1.0-21-amd64 #1 SMP PREEMPT_DYNAMIC Debian 6.1.90-1 (2024-05-03) x86_64 GNU/Linux + Linux i-capture-the-hostname 6.6.13+bpo-amd64 #1 SMP PREEMPT_DYNAMIC Debian 6.6.13-1~bpo12+1 (2024-02-15) x86_64 GNU/Linux I: ls -l /bin - lrwxrwxrwx 1 root root 7 May 7 11:25 /bin -> usr/bin -I: user script /srv/workspace/pbuilder/2456589/tmp/hooks/D02_print_environment finished + lrwxrwxrwx 1 root root 7 Jun 11 17:46 /bin -> usr/bin +I: user script /srv/workspace/pbuilder/3281343/tmp/hooks/D02_print_environment finished -> Attempting to satisfy build-dependencies -> Creating pbuilder-satisfydepends-dummy package Package: pbuilder-satisfydepends-dummy @@ -241,7 +273,7 @@ Get: 101 http://deb.debian.org/debian trixie/main amd64 golang-github-tidwall-rtree-dev all 0.0~git20180113.6cd4270-3 [12.8 kB] Get: 102 http://deb.debian.org/debian trixie/main amd64 golang-github-tidwall-grect-dev all 0.1.0-1 [5568 B] Get: 103 http://deb.debian.org/debian trixie/main amd64 golang-github-tidwall-buntdb-dev all 1.1.7-1 [27.7 kB] -Fetched 80.0 MB in 6s (12.3 MB/s) +Fetched 80.0 MB in 11s (7409 kB/s) debconf: delaying package configuration, since apt-utils is not installed Selecting previously unselected package golang-golang-x-sys-dev. (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 ... 19699 files and directories currently installed.) @@ -673,7 +705,11 @@ fakeroot is already the newest version (1.33-1). 0 upgraded, 0 newly installed, 0 to remove and 0 not upgraded. I: Building the package -I: Running cd /build/reproducible-path/garagemq-0.0~git20200204.15e6a9d+ds/ && 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 > ../garagemq_0.0~git20200204.15e6a9d+ds-4_source.changes +I: user script /srv/workspace/pbuilder/3281343/tmp/hooks/A99_set_merged_usr starting +Not re-configuring usrmerge for trixie +I: user script /srv/workspace/pbuilder/3281343/tmp/hooks/A99_set_merged_usr finished +hostname: Name or service not known +I: Running cd /build/reproducible-path/garagemq-0.0~git20200204.15e6a9d+ds/ && 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 > ../garagemq_0.0~git20200204.15e6a9d+ds-4_source.changes dpkg-buildpackage: info: source package garagemq dpkg-buildpackage: info: source version 0.0~git20200204.15e6a9d+ds-4 dpkg-buildpackage: info: source distribution unstable @@ -691,223 +727,223 @@ 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 20 github.com/valinurovam/garagemq github.com/valinurovam/garagemq/admin github.com/valinurovam/garagemq/amqp github.com/valinurovam/garagemq/auth github.com/valinurovam/garagemq/binding github.com/valinurovam/garagemq/config github.com/valinurovam/garagemq/consumer github.com/valinurovam/garagemq/exchange github.com/valinurovam/garagemq/interfaces github.com/valinurovam/garagemq/metrics github.com/valinurovam/garagemq/msgstorage github.com/valinurovam/garagemq/pool github.com/valinurovam/garagemq/protocol github.com/valinurovam/garagemq/qos github.com/valinurovam/garagemq/queue github.com/valinurovam/garagemq/safequeue github.com/valinurovam/garagemq/server github.com/valinurovam/garagemq/srvstorage github.com/valinurovam/garagemq/storage -cmp -internal/race -internal/coverage/rtcov -log/internal + cd obj-x86_64-linux-gnu && go install -trimpath -v -p 42 github.com/valinurovam/garagemq github.com/valinurovam/garagemq/admin github.com/valinurovam/garagemq/amqp github.com/valinurovam/garagemq/auth github.com/valinurovam/garagemq/binding github.com/valinurovam/garagemq/config github.com/valinurovam/garagemq/consumer github.com/valinurovam/garagemq/exchange github.com/valinurovam/garagemq/interfaces github.com/valinurovam/garagemq/metrics github.com/valinurovam/garagemq/msgstorage github.com/valinurovam/garagemq/pool github.com/valinurovam/garagemq/protocol github.com/valinurovam/garagemq/qos github.com/valinurovam/garagemq/queue github.com/valinurovam/garagemq/safequeue github.com/valinurovam/garagemq/server github.com/valinurovam/garagemq/srvstorage github.com/valinurovam/garagemq/storage encoding -unicode -internal/itoa -unicode/utf16 +github.com/tidwall/btree +internal/coverage/rtcov +github.com/tidwall/tinyqueue internal/godebugs -internal/unsafeheader -unicode/utf8 internal/goarch -sync/atomic -internal/nettrace +github.com/dgraph-io/badger/options +internal/itoa internal/goos -internal/goexperiment -runtime/internal/atomic +internal/nettrace math/bits +internal/unsafeheader +runtime/internal/syscall +internal/race +log/internal internal/cpu +cmp +vendor/golang.org/x/crypto/cryptobyte/asn1 +unicode/utf8 +github.com/dgraph-io/badger/trie +unicode/utf16 container/list crypto/internal/alias -crypto/subtle -runtime/internal/syscall crypto/internal/boring/sig +sync/atomic +crypto/subtle +internal/goexperiment +github.com/dgryski/go-farm +runtime/internal/atomic +unicode +vendor/golang.org/x/crypto/internal/alias +runtime/internal/math internal/chacha8rand internal/abi -runtime/internal/math runtime/internal/sys -vendor/golang.org/x/crypto/cryptobyte/asn1 -vendor/golang.org/x/crypto/internal/alias -github.com/dgraph-io/badger/options -github.com/dgryski/go-farm -github.com/dgraph-io/badger/trie -github.com/tidwall/btree -github.com/tidwall/tinyqueue -slices github.com/pelletier/go-toml/v2/internal/characters github.com/tidwall/match +slices internal/bytealg math -runtime github.com/tidwall/rtree/base +runtime internal/reflectlite sync -internal/testlog internal/singleflight -internal/bisect github.com/valinurovam/garagemq/qos -github.com/spf13/viper/internal/encoding +internal/bisect github.com/tidwall/rtree +internal/testlog +github.com/spf13/viper/internal/encoding runtime/cgo -errors internal/godebug +errors +internal/intern sort +io +math/rand strconv internal/oserror -internal/intern -io -vendor/golang.org/x/net/dns/dnsmessage internal/safefilepath -reflect -github.com/hashicorp/hcl/hcl/strconv path +vendor/golang.org/x/net/dns/dnsmessage +github.com/hashicorp/hcl/hcl/strconv +github.com/tidwall/pretty +container/heap crypto/internal/nistec/fiat +net/netip +reflect crypto/rc4 -math/rand -container/heap -text/tabwriter golang.org/x/crypto/blowfish -github.com/tidwall/pretty -bytes +syscall hash strings +bytes crypto/internal/randutil -net/netip -syscall -crypto +text/tabwriter hash/crc32 +crypto golang.org/x/text/transform github.com/valinurovam/garagemq/pool vendor/golang.org/x/text/transform net/http/internal/ascii regexp/syntax -html bufio +html golang.org/x/text/runes regexp -internal/fmtsort -encoding/binary internal/syscall/execenv internal/syscall/unix time +internal/fmtsort +encoding/binary +github.com/valinurovam/garagemq/metrics +context +github.com/tidwall/gjson +io/fs +internal/poll encoding/base64 +crypto/internal/edwards25519/field crypto/md5 vendor/golang.org/x/crypto/internal/poly1305 -crypto/internal/edwards25519/field github.com/cespare/xxhash crypto/cipher github.com/golang/snappy +golang.org/x/sys/unix +embed +github.com/spf13/afero/internal/common encoding/pem crypto/internal/boring crypto/des vendor/golang.org/x/crypto/chacha20 -context -io/fs -internal/poll -github.com/tidwall/gjson -github.com/valinurovam/garagemq/metrics +crypto/internal/nistec crypto/hmac crypto/sha512 +crypto/aes crypto/sha1 -golang.org/x/sys/unix crypto/sha256 -crypto/aes -crypto/internal/edwards25519 -vendor/golang.org/x/crypto/hkdf -github.com/spf13/afero/internal/common -embed os +vendor/golang.org/x/crypto/hkdf github.com/tidwall/grect -crypto/internal/nistec +crypto/internal/edwards25519 crypto/ecdh -path/filepath -vendor/golang.org/x/sys/cpu -github.com/tidwall/buntdb -os/signal -internal/lazyregexp io/ioutil +internal/lazyregexp +os/signal fmt +github.com/tidwall/buntdb +path/filepath +vendor/golang.org/x/sys/cpu github.com/spf13/afero/mem vendor/golang.org/x/crypto/chacha20poly1305 log -flag encoding/csv +net/url compress/flate -mime/quotedprintable -github.com/subosito/gotenv -encoding/json mime +mime/quotedprintable +net/http/internal +encoding/hex github.com/hashicorp/hcl/hcl/token vendor/golang.org/x/net/http2/hpack +runtime/trace +github.com/subosito/gotenv +flag +github.com/pkg/errors +encoding/xml text/template/parse -net/http/internal -net/url -vendor/golang.org/x/text/unicode/norm -golang.org/x/text/unicode/norm -math/big -encoding/hex -gopkg.in/ini.v1 github.com/pelletier/go-toml/v2/internal/danger -github.com/pelletier/go-toml/v2/unstable +encoding/json github.com/valinurovam/garagemq/amqp +gopkg.in/ini.v1 +golang.org/x/text/unicode/norm +math/big +gopkg.in/yaml.v2 +vendor/golang.org/x/text/unicode/norm gopkg.in/yaml.v3 github.com/hashicorp/hcl/hcl/ast -vendor/golang.org/x/text/unicode/bidi -github.com/spf13/jwalterweatherman -github.com/hashicorp/hcl/hcl/scanner github.com/hashicorp/hcl/json/token -gopkg.in/yaml.v2 -github.com/pkg/errors +github.com/hashicorp/hcl/hcl/scanner +github.com/pelletier/go-toml/v2/unstable golang.org/x/net/internal/timeseries -github.com/hashicorp/hcl/hcl/parser -runtime/trace -compress/gzip -encoding/xml +github.com/spf13/jwalterweatherman +vendor/golang.org/x/text/unicode/bidi github.com/hashicorp/hcl/json/scanner -github.com/pelletier/go-toml/v2/internal/tracker -internal/profile -runtime/pprof -text/template +github.com/hashicorp/hcl/hcl/parser github.com/hashicorp/hcl/json/parser +github.com/pelletier/go-toml/v2/internal/tracker github.com/hashicorp/hcl/hcl/printer -github.com/pelletier/go-toml/v2 vendor/golang.org/x/text/secure/bidirule -github.com/hashicorp/hcl -github.com/fsnotify/fsnotify +compress/gzip +text/template vendor/golang.org/x/net/idna github.com/spf13/viper/internal/encoding/json -github.com/sirupsen/logrus github.com/dgraph-io/ristretto/z github.com/golang/protobuf/proto -github.com/spf13/viper/internal/encoding/hcl github.com/valinurovam/garagemq/binding -github.com/valinurovam/garagemq/interfaces github.com/valinurovam/garagemq/safequeue +github.com/valinurovam/garagemq/interfaces +github.com/hashicorp/hcl +github.com/pelletier/go-toml/v2 +github.com/valinurovam/garagemq/msgstorage +internal/profile +runtime/pprof +github.com/valinurovam/garagemq/config +github.com/spf13/viper/internal/encoding/yaml +github.com/valinurovam/garagemq/exchange +github.com/dgraph-io/ristretto +github.com/valinurovam/garagemq/queue +github.com/spf13/viper/internal/encoding/hcl crypto/rand crypto/internal/boring/bbig crypto/elliptic crypto/internal/bigmod -encoding/asn1 crypto/dsa -github.com/dgraph-io/ristretto +encoding/asn1 github.com/dustin/go-humanize -github.com/valinurovam/garagemq/msgstorage +github.com/fsnotify/fsnotify +github.com/sirupsen/logrus crypto/ed25519 golang.org/x/crypto/bcrypt -github.com/valinurovam/garagemq/exchange github.com/spf13/viper/internal/encoding/toml +github.com/valinurovam/garagemq/consumer +github.com/valinurovam/garagemq/srvstorage github.com/valinurovam/garagemq/auth -github.com/DataDog/zstd -net -crypto/rsa github.com/valinurovam/garagemq/protocol html/template crypto/x509/pkix vendor/golang.org/x/crypto/cryptobyte -github.com/valinurovam/garagemq/config -github.com/valinurovam/garagemq/queue -github.com/spf13/viper/internal/encoding/yaml -github.com/valinurovam/garagemq/consumer -github.com/valinurovam/garagemq/srvstorage -crypto/ecdsa github.com/spf13/cast -github.com/spf13/viper/internal/encoding/dotenv -github.com/spf13/viper/internal/encoding/ini +crypto/ecdsa +crypto/rsa github.com/dgraph-io/badger/pb +github.com/spf13/viper/internal/encoding/ini +github.com/spf13/viper/internal/encoding/dotenv +github.com/DataDog/zstd +net # github.com/DataDog/zstd cgo-gcc-prolog: In function '_cgo_1dd006291257_Cfunc_ZSTD_getDecompressedSize': cgo-gcc-prolog:117:2: warning: 'ZSTD_getDecompressedSize' is deprecated [-Wdeprecated-declarations] @@ -916,10 +952,10 @@ 203 | unsigned long long ZSTD_getDecompressedSize(const void* src, size_t srcSize); | ^~~~~~~~~~~~~~~~~~~~~~~~ vendor/golang.org/x/net/http/httpproxy +net/textproto +github.com/coreos/go-systemd/daemon github.com/mitchellh/mapstructure github.com/spf13/pflag -github.com/coreos/go-systemd/daemon -net/textproto crypto/x509 vendor/golang.org/x/net/http/httpguts mime/multipart @@ -928,9 +964,9 @@ net/http expvar net/http/pprof -golang.org/x/net/trace github.com/magiconair/properties github.com/spf13/afero +golang.org/x/net/trace github.com/spf13/viper/internal/encoding/javaproperties github.com/dgraph-io/badger/y github.com/spf13/viper @@ -944,7 +980,7 @@ debian/rules override_dh_auto_test make[1]: Entering directory '/build/reproducible-path/garagemq-0.0~git20200204.15e6a9d+ds' dh_auto_test || true - cd obj-x86_64-linux-gnu && go test -vet=off -v -p 20 github.com/valinurovam/garagemq github.com/valinurovam/garagemq/admin github.com/valinurovam/garagemq/amqp github.com/valinurovam/garagemq/auth github.com/valinurovam/garagemq/binding github.com/valinurovam/garagemq/config github.com/valinurovam/garagemq/consumer github.com/valinurovam/garagemq/exchange github.com/valinurovam/garagemq/interfaces github.com/valinurovam/garagemq/metrics github.com/valinurovam/garagemq/msgstorage github.com/valinurovam/garagemq/pool github.com/valinurovam/garagemq/protocol github.com/valinurovam/garagemq/qos github.com/valinurovam/garagemq/queue github.com/valinurovam/garagemq/safequeue github.com/valinurovam/garagemq/server github.com/valinurovam/garagemq/srvstorage github.com/valinurovam/garagemq/storage + cd obj-x86_64-linux-gnu && go test -vet=off -v -p 42 github.com/valinurovam/garagemq github.com/valinurovam/garagemq/admin github.com/valinurovam/garagemq/amqp github.com/valinurovam/garagemq/auth github.com/valinurovam/garagemq/binding github.com/valinurovam/garagemq/config github.com/valinurovam/garagemq/consumer github.com/valinurovam/garagemq/exchange github.com/valinurovam/garagemq/interfaces github.com/valinurovam/garagemq/metrics github.com/valinurovam/garagemq/msgstorage github.com/valinurovam/garagemq/pool github.com/valinurovam/garagemq/protocol github.com/valinurovam/garagemq/qos github.com/valinurovam/garagemq/queue github.com/valinurovam/garagemq/safequeue github.com/valinurovam/garagemq/server github.com/valinurovam/garagemq/srvstorage github.com/valinurovam/garagemq/storage # github.com/DataDog/zstd cgo-gcc-prolog: In function '_cgo_1dd006291257_Cfunc_ZSTD_getDecompressedSize': cgo-gcc-prolog:117:2: warning: 'ZSTD_getDecompressedSize' is deprecated [-Wdeprecated-declarations] @@ -1008,17 +1044,17 @@ === RUN TestNewConnectionError --- PASS: TestNewConnectionError (0.00s) PASS -ok github.com/valinurovam/garagemq/amqp 0.011s +ok github.com/valinurovam/garagemq/amqp 0.003s === RUN TestParsePlain_Success --- PASS: TestParsePlain_Success (0.00s) === RUN TestParsePlain_Failed_WrongFormat --- PASS: TestParsePlain_Failed_WrongFormat (0.00s) === RUN TestCheckPasswordHash_Bcrypt ---- PASS: TestCheckPasswordHash_Bcrypt (0.31s) +--- PASS: TestCheckPasswordHash_Bcrypt (0.22s) === RUN TestCheckPasswordHash_MD5 --- PASS: TestCheckPasswordHash_MD5 (0.00s) PASS -ok github.com/valinurovam/garagemq/auth 0.426s +ok github.com/valinurovam/garagemq/auth 0.225s === RUN TestBinding_MatchTopic --- PASS: TestBinding_MatchTopic (0.00s) === RUN TestBinding_MatchDirect @@ -1036,7 +1072,7 @@ === RUN TestBinding_NewBindingPanicOnBadXMatch --- PASS: TestBinding_NewBindingPanicOnBadXMatch (0.00s) PASS -ok github.com/valinurovam/garagemq/binding 0.010s +ok github.com/valinurovam/garagemq/binding 0.003s === RUN TestNew --- PASS: TestNew (0.00s) === RUN TestExchange_AppendBinding @@ -1086,7 +1122,7 @@ === RUN TestExchange_GetTypeAlias --- PASS: TestExchange_GetTypeAlias (0.00s) PASS -ok github.com/valinurovam/garagemq/exchange 0.011s +ok github.com/valinurovam/garagemq/exchange 0.003s === RUN TestAmqpQos_IsActive --- PASS: TestAmqpQos_IsActive (0.00s) === RUN TestAmqpQos_Dec @@ -1100,7 +1136,7 @@ === RUN TestAmqpQos_Copy --- PASS: TestAmqpQos_Copy (0.00s) PASS -ok github.com/valinurovam/garagemq/qos 0.010s +ok github.com/valinurovam/garagemq/qos 0.003s === RUN TestQueue_Property --- PASS: TestQueue_Property (0.00s) === RUN TestQueue_PushPop_Inactive @@ -1166,7 +1202,7 @@ === RUN TestQueue_SetMetrics --- PASS: TestQueue_SetMetrics (0.00s) === RUN TestQueue_LoadFromStorage_Swap ---- PASS: TestQueue_LoadFromStorage_Swap (0.27s) +--- PASS: TestQueue_LoadFromStorage_Swap (0.26s) === RUN TestQueue_LoadFromMsgStorage_LessMaxMessages --- PASS: TestQueue_LoadFromMsgStorage_LessMaxMessages (0.00s) === RUN TestQueue_LoadFromMsgStorage_OverMaxMessages @@ -1176,964 +1212,964 @@ === RUN TestQueue_CancelConsumers --- PASS: TestQueue_CancelConsumers (0.00s) PASS -ok github.com/valinurovam/garagemq/queue 0.285s +ok github.com/valinurovam/garagemq/queue 0.264s === RUN TestSafeQueue ---- PASS: TestSafeQueue (0.24s) +--- PASS: TestSafeQueue (0.10s) === RUN TestSafeQueue_PushHead ---- PASS: TestSafeQueue_PushHead (0.28s) +--- PASS: TestSafeQueue_PushHead (0.14s) === RUN TestSafeQueue_HeadItem ---- PASS: TestSafeQueue_HeadItem (0.02s) +--- PASS: TestSafeQueue_HeadItem (0.01s) === RUN TestSafeQueue_DirtyLength --- PASS: TestSafeQueue_DirtyLength (0.01s) === RUN TestSafeQueue_Purge ---- PASS: TestSafeQueue_Purge (0.02s) +--- PASS: TestSafeQueue_Purge (0.01s) PASS -ok github.com/valinurovam/garagemq/safequeue 0.582s +ok github.com/valinurovam/garagemq/safequeue 0.273s ? github.com/valinurovam/garagemq/srvstorage [no test files] ? github.com/valinurovam/garagemq/storage [no test files] === RUN Test_BasicQos_Channel_Success -badger 2024/05/09 21:04:34 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:04:34 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:04:34 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:04:35 INFO: Storing value log head: {Fid:0 Len:29 Offset:52} -badger 2024/05/09 21:04:35 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 -badger 2024/05/09 21:04:35 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 26.795941ms -badger 2024/05/09 21:04:35 INFO: [Compactor: 173] Compaction for level: 0 DONE -badger 2024/05/09 21:04:35 INFO: Force compaction on level 0 done ---- PASS: Test_BasicQos_Channel_Success (1.55s) +badger 2025/06/12 03:33:34 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:33:34 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:33:34 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:33:34 INFO: Storing value log head: {Fid:0 Len:29 Offset:52} +badger 2025/06/12 03:33:34 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 +badger 2025/06/12 03:33:35 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 337.968375ms +badger 2025/06/12 03:33:35 INFO: [Compactor: 173] Compaction for level: 0 DONE +badger 2025/06/12 03:33:35 INFO: Force compaction on level 0 done +--- PASS: Test_BasicQos_Channel_Success (1.97s) === RUN Test_BasicQos_Global_Success -badger 2024/05/09 21:04:35 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:04:35 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:04:35 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:04:36 INFO: Storing value log head: {Fid:0 Len:29 Offset:52} -badger 2024/05/09 21:04:36 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 -badger 2024/05/09 21:04:36 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 21.659599ms -badger 2024/05/09 21:04:36 INFO: [Compactor: 173] Compaction for level: 0 DONE -badger 2024/05/09 21:04:36 INFO: Force compaction on level 0 done ---- PASS: Test_BasicQos_Global_Success (0.31s) +badger 2025/06/12 03:33:35 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:33:35 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:33:36 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:33:37 INFO: Storing value log head: {Fid:0 Len:29 Offset:52} +badger 2025/06/12 03:33:37 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 +badger 2025/06/12 03:33:38 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 836.485276ms +badger 2025/06/12 03:33:38 INFO: [Compactor: 173] Compaction for level: 0 DONE +badger 2025/06/12 03:33:38 INFO: Force compaction on level 0 done +--- PASS: Test_BasicQos_Global_Success (3.34s) === RUN Test_BasicQos_Check_Global_Success -badger 2024/05/09 21:04:36 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:04:36 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:04:36 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:04:36 INFO: Storing value log head: {Fid:0 Len:29 Offset:52} -badger 2024/05/09 21:04:36 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 -badger 2024/05/09 21:04:36 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 22.216502ms -badger 2024/05/09 21:04:36 INFO: [Compactor: 173] Compaction for level: 0 DONE -badger 2024/05/09 21:04:36 INFO: Force compaction on level 0 done ---- PASS: Test_BasicQos_Check_Global_Success (0.62s) +badger 2025/06/12 03:33:40 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:33:40 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:33:40 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:33:40 INFO: Storing value log head: {Fid:0 Len:29 Offset:52} +badger 2025/06/12 03:33:40 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 +badger 2025/06/12 03:33:40 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 9.450033ms +badger 2025/06/12 03:33:40 INFO: [Compactor: 173] Compaction for level: 0 DONE +badger 2025/06/12 03:33:40 INFO: Force compaction on level 0 done +--- PASS: Test_BasicQos_Check_Global_Success (1.95s) === RUN Test_BasicQos_Check_NonGlobal_Success -badger 2024/05/09 21:04:36 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:04:36 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:04:36 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:04:37 INFO: Storing value log head: {Fid:0 Len:29 Offset:52} -badger 2024/05/09 21:04:37 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 -badger 2024/05/09 21:04:37 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 23.028981ms -badger 2024/05/09 21:04:37 INFO: [Compactor: 173] Compaction for level: 0 DONE -badger 2024/05/09 21:04:37 INFO: Force compaction on level 0 done ---- PASS: Test_BasicQos_Check_NonGlobal_Success (1.26s) +badger 2025/06/12 03:33:41 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:33:41 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:33:41 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:33:41 INFO: Storing value log head: {Fid:0 Len:29 Offset:52} +badger 2025/06/12 03:33:41 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 +badger 2025/06/12 03:33:41 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 11.824012ms +badger 2025/06/12 03:33:41 INFO: [Compactor: 173] Compaction for level: 0 DONE +badger 2025/06/12 03:33:41 INFO: Force compaction on level 0 done +--- PASS: Test_BasicQos_Check_NonGlobal_Success (0.60s) === RUN Test_BasicPublish_Success -badger 2024/05/09 21:04:38 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:04:38 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:04:38 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:04:38 INFO: Storing value log head: {Fid:0 Len:29 Offset:52} -badger 2024/05/09 21:04:38 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 -badger 2024/05/09 21:04:38 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 26.205553ms -badger 2024/05/09 21:04:38 INFO: [Compactor: 173] Compaction for level: 0 DONE -badger 2024/05/09 21:04:38 INFO: Force compaction on level 0 done ---- PASS: Test_BasicPublish_Success (0.44s) +badger 2025/06/12 03:33:41 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:33:41 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:33:41 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:33:41 INFO: Storing value log head: {Fid:0 Len:29 Offset:52} +badger 2025/06/12 03:33:41 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 +badger 2025/06/12 03:33:41 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 57.46772ms +badger 2025/06/12 03:33:41 INFO: [Compactor: 173] Compaction for level: 0 DONE +badger 2025/06/12 03:33:41 INFO: Force compaction on level 0 done +--- PASS: Test_BasicPublish_Success (0.19s) === RUN Test_BasicPublish_Persistent_Success -badger 2024/05/09 21:04:38 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:04:38 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:04:38 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:04:38 INFO: Storing value log head: {Fid:0 Len:29 Offset:188} -badger 2024/05/09 21:04:38 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 -badger 2024/05/09 21:04:38 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 48.892882ms -badger 2024/05/09 21:04:38 INFO: [Compactor: 173] Compaction for level: 0 DONE -badger 2024/05/09 21:04:38 INFO: Force compaction on level 0 done -badger 2024/05/09 21:04:38 INFO: Storing value log head: {Fid:0 Len:29 Offset:186} -badger 2024/05/09 21:04:38 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 -badger 2024/05/09 21:04:38 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 104.454806ms -badger 2024/05/09 21:04:38 INFO: [Compactor: 173] Compaction for level: 0 DONE -badger 2024/05/09 21:04:38 INFO: Force compaction on level 0 done -badger 2024/05/09 21:04:39 INFO: All 1 tables opened in 0s -badger 2024/05/09 21:04:39 INFO: Replaying file id: 0 at offset: 215 -badger 2024/05/09 21:04:39 INFO: Replay took: 4.901µs -badger 2024/05/09 21:04:39 INFO: All 1 tables opened in 0s -badger 2024/05/09 21:04:39 INFO: Replaying file id: 0 at offset: 217 -badger 2024/05/09 21:04:39 INFO: Replay took: 8.225µs -badger 2024/05/09 21:04:39 INFO: All 0 tables opened in 0s ---- PASS: Test_BasicPublish_Persistent_Success (0.81s) +badger 2025/06/12 03:33:41 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:33:41 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:33:41 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:33:42 INFO: Storing value log head: {Fid:0 Len:29 Offset:188} +badger 2025/06/12 03:33:42 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 +badger 2025/06/12 03:33:42 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 9.219542ms +badger 2025/06/12 03:33:42 INFO: [Compactor: 173] Compaction for level: 0 DONE +badger 2025/06/12 03:33:42 INFO: Force compaction on level 0 done +badger 2025/06/12 03:33:42 INFO: Storing value log head: {Fid:0 Len:29 Offset:186} +badger 2025/06/12 03:33:42 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 +badger 2025/06/12 03:33:42 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 12.939227ms +badger 2025/06/12 03:33:42 INFO: [Compactor: 173] Compaction for level: 0 DONE +badger 2025/06/12 03:33:42 INFO: Force compaction on level 0 done +badger 2025/06/12 03:33:42 INFO: All 1 tables opened in 0s +badger 2025/06/12 03:33:42 INFO: Replaying file id: 0 at offset: 215 +badger 2025/06/12 03:33:42 INFO: Replay took: 5.352µs +badger 2025/06/12 03:33:42 INFO: All 1 tables opened in 0s +badger 2025/06/12 03:33:42 INFO: Replaying file id: 0 at offset: 217 +badger 2025/06/12 03:33:42 INFO: Replay took: 5.099µs +badger 2025/06/12 03:33:42 INFO: All 0 tables opened in 0s +--- PASS: Test_BasicPublish_Persistent_Success (0.33s) === RUN Test_BasicPublish_Persistent_Failed_QueueNonDurable -badger 2024/05/09 21:04:39 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:04:39 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:04:39 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:04:39 INFO: Storing value log head: {Fid:0 Len:29 Offset:52} -badger 2024/05/09 21:04:39 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 -badger 2024/05/09 21:04:39 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 40.085586ms -badger 2024/05/09 21:04:39 INFO: [Compactor: 173] Compaction for level: 0 DONE -badger 2024/05/09 21:04:39 INFO: Force compaction on level 0 done ---- PASS: Test_BasicPublish_Persistent_Failed_QueueNonDurable (0.80s) +badger 2025/06/12 03:33:42 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:33:42 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:33:42 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:33:42 INFO: Storing value log head: {Fid:0 Len:29 Offset:52} +badger 2025/06/12 03:33:42 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 +badger 2025/06/12 03:33:42 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 85.085474ms +badger 2025/06/12 03:33:42 INFO: [Compactor: 173] Compaction for level: 0 DONE +badger 2025/06/12 03:33:42 INFO: Force compaction on level 0 done +--- PASS: Test_BasicPublish_Persistent_Failed_QueueNonDurable (0.61s) === RUN Test_BasicPublish_Failed_ExchangeNotFound -badger 2024/05/09 21:04:40 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:04:40 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:04:40 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:04:40 INFO: Storing value log head: {Fid:0 Len:29 Offset:52} -badger 2024/05/09 21:04:40 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 -badger 2024/05/09 21:04:40 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 25.194717ms -badger 2024/05/09 21:04:40 INFO: [Compactor: 173] Compaction for level: 0 DONE -badger 2024/05/09 21:04:40 INFO: Force compaction on level 0 done ---- PASS: Test_BasicPublish_Failed_ExchangeNotFound (0.79s) +badger 2025/06/12 03:33:44 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:33:44 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:33:44 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:33:44 INFO: Storing value log head: {Fid:0 Len:29 Offset:52} +badger 2025/06/12 03:33:44 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 +badger 2025/06/12 03:33:44 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 5.893468ms +badger 2025/06/12 03:33:44 INFO: [Compactor: 173] Compaction for level: 0 DONE +badger 2025/06/12 03:33:44 INFO: Force compaction on level 0 done +--- PASS: Test_BasicPublish_Failed_ExchangeNotFound (1.97s) === RUN Test_BasicPublish_Failed_Immediate -badger 2024/05/09 21:04:40 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:04:40 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:04:40 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:04:41 INFO: Storing value log head: {Fid:0 Len:29 Offset:52} -badger 2024/05/09 21:04:41 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 -badger 2024/05/09 21:04:41 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 31.812896ms -badger 2024/05/09 21:04:41 INFO: [Compactor: 173] Compaction for level: 0 DONE -badger 2024/05/09 21:04:41 INFO: Force compaction on level 0 done ---- PASS: Test_BasicPublish_Failed_Immediate (0.42s) +badger 2025/06/12 03:33:44 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:33:44 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:33:44 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:33:44 INFO: Storing value log head: {Fid:0 Len:29 Offset:52} +badger 2025/06/12 03:33:44 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 +badger 2025/06/12 03:33:44 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 11.324276ms +badger 2025/06/12 03:33:44 INFO: [Compactor: 173] Compaction for level: 0 DONE +badger 2025/06/12 03:33:44 INFO: Force compaction on level 0 done +--- PASS: Test_BasicPublish_Failed_Immediate (0.28s) === RUN Test_BasicPublish_Failed_Mandatory -badger 2024/05/09 21:04:41 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:04:41 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:04:41 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:04:41 INFO: Storing value log head: {Fid:0 Len:29 Offset:52} -badger 2024/05/09 21:04:41 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 -badger 2024/05/09 21:04:41 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 32.209147ms -badger 2024/05/09 21:04:41 INFO: [Compactor: 173] Compaction for level: 0 DONE -badger 2024/05/09 21:04:41 INFO: Force compaction on level 0 done ---- PASS: Test_BasicPublish_Failed_Mandatory (0.37s) +badger 2025/06/12 03:33:44 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:33:45 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:33:45 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:33:45 INFO: Storing value log head: {Fid:0 Len:29 Offset:52} +badger 2025/06/12 03:33:45 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 +badger 2025/06/12 03:33:45 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 11.811595ms +badger 2025/06/12 03:33:45 INFO: [Compactor: 173] Compaction for level: 0 DONE +badger 2025/06/12 03:33:45 INFO: Force compaction on level 0 done +--- PASS: Test_BasicPublish_Failed_Mandatory (0.24s) === RUN Test_BasicConsume_WithOrderCheck_Success -badger 2024/05/09 21:04:41 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:04:41 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:04:41 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:04:42 INFO: Storing value log head: {Fid:0 Len:29 Offset:52} -badger 2024/05/09 21:04:42 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 -badger 2024/05/09 21:04:42 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 26.822638ms -badger 2024/05/09 21:04:42 INFO: [Compactor: 173] Compaction for level: 0 DONE -badger 2024/05/09 21:04:42 INFO: Force compaction on level 0 done ---- PASS: Test_BasicConsume_WithOrderCheck_Success (0.70s) +badger 2025/06/12 03:33:45 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:33:45 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:33:45 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:33:45 INFO: Storing value log head: {Fid:0 Len:29 Offset:52} +badger 2025/06/12 03:33:45 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 +badger 2025/06/12 03:33:45 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 8.834334ms +badger 2025/06/12 03:33:45 INFO: [Compactor: 173] Compaction for level: 0 DONE +badger 2025/06/12 03:33:45 INFO: Force compaction on level 0 done +--- PASS: Test_BasicConsume_WithOrderCheck_Success (0.45s) === RUN Test_BasicConsume_Failed_QueueNotFound -badger 2024/05/09 21:04:42 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:04:42 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:04:43 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:04:46 INFO: Storing value log head: {Fid:0 Len:29 Offset:52} -badger 2024/05/09 21:04:46 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 -badger 2024/05/09 21:04:46 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 24.698473ms -badger 2024/05/09 21:04:46 INFO: [Compactor: 173] Compaction for level: 0 DONE -badger 2024/05/09 21:04:46 INFO: Force compaction on level 0 done ---- PASS: Test_BasicConsume_Failed_QueueNotFound (4.01s) +badger 2025/06/12 03:33:45 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:33:45 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:33:45 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:33:45 INFO: Storing value log head: {Fid:0 Len:29 Offset:52} +badger 2025/06/12 03:33:45 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 +badger 2025/06/12 03:33:45 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 29.767968ms +badger 2025/06/12 03:33:45 INFO: [Compactor: 173] Compaction for level: 0 DONE +badger 2025/06/12 03:33:45 INFO: Force compaction on level 0 done +--- PASS: Test_BasicConsume_Failed_QueueNotFound (0.22s) === RUN Test_BasicConsume_Failed_SameTag -badger 2024/05/09 21:04:46 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:04:46 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:04:46 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:04:46 INFO: Storing value log head: {Fid:0 Len:29 Offset:52} -badger 2024/05/09 21:04:46 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 -badger 2024/05/09 21:04:46 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 26.264062ms -badger 2024/05/09 21:04:46 INFO: [Compactor: 173] Compaction for level: 0 DONE -badger 2024/05/09 21:04:46 INFO: Force compaction on level 0 done ---- PASS: Test_BasicConsume_Failed_SameTag (0.31s) +badger 2025/06/12 03:33:45 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:33:45 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:33:45 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:33:45 INFO: Storing value log head: {Fid:0 Len:29 Offset:52} +badger 2025/06/12 03:33:45 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 +badger 2025/06/12 03:33:46 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 163.524863ms +badger 2025/06/12 03:33:46 INFO: [Compactor: 173] Compaction for level: 0 DONE +badger 2025/06/12 03:33:46 INFO: Force compaction on level 0 done +--- PASS: Test_BasicConsume_Failed_SameTag (0.26s) === RUN Test_BasicConsume_Failed_ExclusiveQueue -badger 2024/05/09 21:04:46 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:04:46 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:04:46 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:04:46 INFO: Storing value log head: {Fid:0 Len:29 Offset:52} -badger 2024/05/09 21:04:46 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 -badger 2024/05/09 21:04:46 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 40.348674ms -badger 2024/05/09 21:04:46 INFO: [Compactor: 173] Compaction for level: 0 DONE -badger 2024/05/09 21:04:46 INFO: Force compaction on level 0 done ---- PASS: Test_BasicConsume_Failed_ExclusiveQueue (0.32s) +badger 2025/06/12 03:33:46 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:33:46 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:33:46 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:33:46 INFO: Storing value log head: {Fid:0 Len:29 Offset:52} +badger 2025/06/12 03:33:46 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 +badger 2025/06/12 03:33:46 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 11.716151ms +badger 2025/06/12 03:33:46 INFO: [Compactor: 173] Compaction for level: 0 DONE +badger 2025/06/12 03:33:46 INFO: Force compaction on level 0 done +--- PASS: Test_BasicConsume_Failed_ExclusiveQueue (0.11s) === RUN Test_BasicConsume_Success_Exclusive_Reconsume -badger 2024/05/09 21:04:46 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:04:47 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:04:47 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:04:48 INFO: Storing value log head: {Fid:0 Len:29 Offset:52} -badger 2024/05/09 21:04:48 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 -badger 2024/05/09 21:04:48 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 31.614598ms -badger 2024/05/09 21:04:48 INFO: [Compactor: 173] Compaction for level: 0 DONE -badger 2024/05/09 21:04:48 INFO: Force compaction on level 0 done ---- PASS: Test_BasicConsume_Success_Exclusive_Reconsume (1.30s) +badger 2025/06/12 03:33:46 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:33:46 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:33:46 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:33:46 INFO: Storing value log head: {Fid:0 Len:29 Offset:52} +badger 2025/06/12 03:33:46 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 +badger 2025/06/12 03:33:46 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 8.394783ms +badger 2025/06/12 03:33:46 INFO: [Compactor: 173] Compaction for level: 0 DONE +badger 2025/06/12 03:33:46 INFO: Force compaction on level 0 done +--- PASS: Test_BasicConsume_Success_Exclusive_Reconsume (0.20s) === RUN Test_BasicCancel_Success -badger 2024/05/09 21:04:48 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:04:48 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:04:48 INFO: All 0 tables opened in 1ms -badger 2024/05/09 21:04:48 INFO: Storing value log head: {Fid:0 Len:29 Offset:52} -badger 2024/05/09 21:04:48 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 -badger 2024/05/09 21:04:48 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 31.394291ms -badger 2024/05/09 21:04:48 INFO: [Compactor: 173] Compaction for level: 0 DONE -badger 2024/05/09 21:04:48 INFO: Force compaction on level 0 done ---- PASS: Test_BasicCancel_Success (0.34s) +badger 2025/06/12 03:33:46 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:33:46 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:33:46 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:33:46 INFO: Storing value log head: {Fid:0 Len:29 Offset:52} +badger 2025/06/12 03:33:46 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 +badger 2025/06/12 03:33:46 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 8.332348ms +badger 2025/06/12 03:33:46 INFO: [Compactor: 173] Compaction for level: 0 DONE +badger 2025/06/12 03:33:46 INFO: Force compaction on level 0 done +--- PASS: Test_BasicCancel_Success (0.12s) === RUN Test_BasicCancel_Failed_Unknown_Tag -badger 2024/05/09 21:04:48 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:04:48 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:04:48 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:04:48 INFO: Storing value log head: {Fid:0 Len:29 Offset:52} -badger 2024/05/09 21:04:48 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 -badger 2024/05/09 21:04:48 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 21.37906ms -badger 2024/05/09 21:04:48 INFO: [Compactor: 173] Compaction for level: 0 DONE -badger 2024/05/09 21:04:48 INFO: Force compaction on level 0 done ---- PASS: Test_BasicCancel_Failed_Unknown_Tag (0.30s) +badger 2025/06/12 03:33:46 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:33:46 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:33:46 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:33:46 INFO: Storing value log head: {Fid:0 Len:29 Offset:52} +badger 2025/06/12 03:33:46 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 +badger 2025/06/12 03:33:46 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 13.46126ms +badger 2025/06/12 03:33:46 INFO: [Compactor: 173] Compaction for level: 0 DONE +badger 2025/06/12 03:33:46 INFO: Force compaction on level 0 done +--- PASS: Test_BasicCancel_Failed_Unknown_Tag (0.16s) === RUN Test_BasicAck_Success -badger 2024/05/09 21:04:48 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:04:48 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:04:49 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:04:49 INFO: Storing value log head: {Fid:0 Len:29 Offset:52} -badger 2024/05/09 21:04:49 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 -badger 2024/05/09 21:04:49 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 25.569999ms -badger 2024/05/09 21:04:49 INFO: [Compactor: 173] Compaction for level: 0 DONE -badger 2024/05/09 21:04:49 INFO: Force compaction on level 0 done ---- PASS: Test_BasicAck_Success (0.50s) +badger 2025/06/12 03:33:46 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:33:46 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:33:46 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:33:47 INFO: Storing value log head: {Fid:0 Len:29 Offset:52} +badger 2025/06/12 03:33:47 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 +badger 2025/06/12 03:33:47 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 9.552059ms +badger 2025/06/12 03:33:47 INFO: [Compactor: 173] Compaction for level: 0 DONE +badger 2025/06/12 03:33:47 INFO: Force compaction on level 0 done +--- PASS: Test_BasicAck_Success (0.44s) === RUN Test_BasicAckMultiple_Success -badger 2024/05/09 21:04:49 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:04:49 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:04:49 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:04:49 INFO: Storing value log head: {Fid:0 Len:29 Offset:52} -badger 2024/05/09 21:04:49 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 -badger 2024/05/09 21:04:49 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 23.110401ms -badger 2024/05/09 21:04:49 INFO: [Compactor: 173] Compaction for level: 0 DONE -badger 2024/05/09 21:04:49 INFO: Force compaction on level 0 done ---- PASS: Test_BasicAckMultiple_Success (0.53s) +badger 2025/06/12 03:33:47 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:33:47 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:33:47 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:33:47 INFO: Storing value log head: {Fid:0 Len:29 Offset:52} +badger 2025/06/12 03:33:47 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 +badger 2025/06/12 03:33:47 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 7.727181ms +badger 2025/06/12 03:33:47 INFO: [Compactor: 173] Compaction for level: 0 DONE +badger 2025/06/12 03:33:47 INFO: Force compaction on level 0 done +--- PASS: Test_BasicAckMultiple_Success (0.61s) === RUN Test_BasicNack_RequeueTrue_Success -badger 2024/05/09 21:04:49 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:04:50 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:04:50 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:04:50 INFO: Storing value log head: {Fid:0 Len:29 Offset:52} -badger 2024/05/09 21:04:50 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 -badger 2024/05/09 21:04:50 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 21.375755ms -badger 2024/05/09 21:04:50 INFO: [Compactor: 173] Compaction for level: 0 DONE -badger 2024/05/09 21:04:50 INFO: Force compaction on level 0 done ---- PASS: Test_BasicNack_RequeueTrue_Success (0.71s) +badger 2025/06/12 03:33:48 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:33:48 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:33:48 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:33:50 INFO: Storing value log head: {Fid:0 Len:29 Offset:52} +badger 2025/06/12 03:33:50 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 +badger 2025/06/12 03:33:50 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 17.930509ms +badger 2025/06/12 03:33:50 INFO: [Compactor: 173] Compaction for level: 0 DONE +badger 2025/06/12 03:33:50 INFO: Force compaction on level 0 done +--- PASS: Test_BasicNack_RequeueTrue_Success (2.30s) === RUN Test_BasicNack_RequeueTrue_Multiple_Success -badger 2024/05/09 21:04:50 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:04:50 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:04:51 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:04:51 INFO: Storing value log head: {Fid:0 Len:29 Offset:52} -badger 2024/05/09 21:04:51 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 -badger 2024/05/09 21:04:51 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 31.652005ms -badger 2024/05/09 21:04:51 INFO: [Compactor: 173] Compaction for level: 0 DONE -badger 2024/05/09 21:04:51 INFO: Force compaction on level 0 done ---- PASS: Test_BasicNack_RequeueTrue_Multiple_Success (0.91s) +badger 2025/06/12 03:33:50 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:33:50 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:33:50 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:33:51 INFO: Storing value log head: {Fid:0 Len:29 Offset:52} +badger 2025/06/12 03:33:52 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 +badger 2025/06/12 03:33:53 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 947.025161ms +badger 2025/06/12 03:33:53 INFO: [Compactor: 173] Compaction for level: 0 DONE +badger 2025/06/12 03:33:53 INFO: Force compaction on level 0 done +--- PASS: Test_BasicNack_RequeueTrue_Multiple_Success (3.50s) === RUN Test_BasicNack_RequeueFalse_Success -badger 2024/05/09 21:04:51 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:04:51 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:04:51 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:04:52 INFO: Storing value log head: {Fid:0 Len:29 Offset:52} -badger 2024/05/09 21:04:52 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 -badger 2024/05/09 21:04:52 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 32.150766ms -badger 2024/05/09 21:04:52 INFO: [Compactor: 173] Compaction for level: 0 DONE -badger 2024/05/09 21:04:52 INFO: Force compaction on level 0 done ---- PASS: Test_BasicNack_RequeueFalse_Success (0.89s) +badger 2025/06/12 03:33:54 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:33:54 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:33:54 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:33:54 INFO: Storing value log head: {Fid:0 Len:29 Offset:52} +badger 2025/06/12 03:33:54 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 +badger 2025/06/12 03:33:54 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 13.312818ms +badger 2025/06/12 03:33:54 INFO: [Compactor: 173] Compaction for level: 0 DONE +badger 2025/06/12 03:33:54 INFO: Force compaction on level 0 done +--- PASS: Test_BasicNack_RequeueFalse_Success (0.97s) === RUN Test_BasicNack_RequeueFalse_Multiple_Success -badger 2024/05/09 21:04:52 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:04:52 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:04:52 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:04:52 INFO: Storing value log head: {Fid:0 Len:29 Offset:52} -badger 2024/05/09 21:04:52 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 -badger 2024/05/09 21:04:52 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 20.765547ms -badger 2024/05/09 21:04:52 INFO: [Compactor: 173] Compaction for level: 0 DONE -badger 2024/05/09 21:04:52 INFO: Force compaction on level 0 done ---- PASS: Test_BasicNack_RequeueFalse_Multiple_Success (0.58s) +badger 2025/06/12 03:33:54 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:33:54 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:33:54 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:33:54 INFO: Storing value log head: {Fid:0 Len:29 Offset:52} +badger 2025/06/12 03:33:54 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 +badger 2025/06/12 03:33:54 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 9.566377ms +badger 2025/06/12 03:33:54 INFO: [Compactor: 173] Compaction for level: 0 DONE +badger 2025/06/12 03:33:54 INFO: Force compaction on level 0 done +--- PASS: Test_BasicNack_RequeueFalse_Multiple_Success (0.39s) === RUN Test_BasicReject_RequeueTrue_Success -badger 2024/05/09 21:04:53 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:04:53 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:04:53 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:04:53 INFO: Storing value log head: {Fid:0 Len:29 Offset:52} -badger 2024/05/09 21:04:53 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 -badger 2024/05/09 21:04:53 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 29.697564ms -badger 2024/05/09 21:04:53 INFO: [Compactor: 173] Compaction for level: 0 DONE -badger 2024/05/09 21:04:53 INFO: Force compaction on level 0 done ---- PASS: Test_BasicReject_RequeueTrue_Success (0.51s) +badger 2025/06/12 03:33:54 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:33:54 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:33:54 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:33:55 INFO: Storing value log head: {Fid:0 Len:29 Offset:52} +badger 2025/06/12 03:33:55 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 +badger 2025/06/12 03:33:55 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 131.990491ms +badger 2025/06/12 03:33:55 INFO: [Compactor: 173] Compaction for level: 0 DONE +badger 2025/06/12 03:33:55 INFO: Force compaction on level 0 done +--- PASS: Test_BasicReject_RequeueTrue_Success (0.87s) === RUN Test_BasicReject_RequeueFalse_Success -badger 2024/05/09 21:04:53 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:04:53 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:04:53 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:04:53 INFO: Storing value log head: {Fid:0 Len:29 Offset:52} -badger 2024/05/09 21:04:53 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 -badger 2024/05/09 21:04:53 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 27.411859ms -badger 2024/05/09 21:04:53 INFO: [Compactor: 173] Compaction for level: 0 DONE -badger 2024/05/09 21:04:53 INFO: Force compaction on level 0 done ---- PASS: Test_BasicReject_RequeueFalse_Success (0.51s) +badger 2025/06/12 03:33:55 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:33:55 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:33:55 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:33:56 INFO: Storing value log head: {Fid:0 Len:29 Offset:52} +badger 2025/06/12 03:33:56 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 +badger 2025/06/12 03:33:56 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 198.386871ms +badger 2025/06/12 03:33:56 INFO: [Compactor: 173] Compaction for level: 0 DONE +badger 2025/06/12 03:33:56 INFO: Force compaction on level 0 done +--- PASS: Test_BasicReject_RequeueFalse_Success (0.84s) === RUN Test_BasicGet_Success -badger 2024/05/09 21:04:54 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:04:54 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:04:54 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:04:54 INFO: Storing value log head: {Fid:0 Len:29 Offset:156} -badger 2024/05/09 21:04:54 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 -badger 2024/05/09 21:04:54 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 26.826603ms -badger 2024/05/09 21:04:54 INFO: [Compactor: 173] Compaction for level: 0 DONE -badger 2024/05/09 21:04:54 INFO: Force compaction on level 0 done ---- PASS: Test_BasicGet_Success (0.35s) +badger 2025/06/12 03:33:56 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:33:56 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:33:56 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:33:56 INFO: Storing value log head: {Fid:0 Len:29 Offset:156} +badger 2025/06/12 03:33:56 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 +badger 2025/06/12 03:33:56 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 10.130488ms +badger 2025/06/12 03:33:56 INFO: [Compactor: 173] Compaction for level: 0 DONE +badger 2025/06/12 03:33:56 INFO: Force compaction on level 0 done +--- PASS: Test_BasicGet_Success (0.31s) === RUN Test_BasicGet_Success_Empty -badger 2024/05/09 21:04:54 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:04:54 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:04:54 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:04:54 INFO: Storing value log head: {Fid:0 Len:29 Offset:168} -badger 2024/05/09 21:04:54 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 -badger 2024/05/09 21:04:54 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 59.687776ms -badger 2024/05/09 21:04:54 INFO: [Compactor: 173] Compaction for level: 0 DONE -badger 2024/05/09 21:04:54 INFO: Force compaction on level 0 done ---- PASS: Test_BasicGet_Success_Empty (0.48s) +badger 2025/06/12 03:33:57 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:33:57 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:33:57 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:33:57 INFO: Storing value log head: {Fid:0 Len:29 Offset:168} +badger 2025/06/12 03:33:57 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 +badger 2025/06/12 03:33:57 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 16.920568ms +badger 2025/06/12 03:33:57 INFO: [Compactor: 173] Compaction for level: 0 DONE +badger 2025/06/12 03:33:57 INFO: Force compaction on level 0 done +--- PASS: Test_BasicGet_Success_Empty (0.23s) === RUN Test_BasicGet_Success_WithAck -badger 2024/05/09 21:04:54 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:04:54 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:04:55 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:04:55 INFO: Storing value log head: {Fid:0 Len:29 Offset:172} -badger 2024/05/09 21:04:55 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 -badger 2024/05/09 21:04:55 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 44.076285ms -badger 2024/05/09 21:04:55 INFO: [Compactor: 173] Compaction for level: 0 DONE -badger 2024/05/09 21:04:55 INFO: Force compaction on level 0 done ---- PASS: Test_BasicGet_Success_WithAck (0.37s) +badger 2025/06/12 03:33:57 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:33:57 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:33:57 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:33:57 INFO: Storing value log head: {Fid:0 Len:29 Offset:172} +badger 2025/06/12 03:33:57 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 +badger 2025/06/12 03:33:57 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 10.345186ms +badger 2025/06/12 03:33:57 INFO: [Compactor: 173] Compaction for level: 0 DONE +badger 2025/06/12 03:33:57 INFO: Force compaction on level 0 done +--- PASS: Test_BasicGet_Success_WithAck (0.13s) === RUN Test_BasicGet_Succ -badger 2024/05/09 21:04:55 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:04:55 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:04:55 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:04:55 INFO: Storing value log head: {Fid:0 Len:29 Offset:150} -badger 2024/05/09 21:04:55 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 -badger 2024/05/09 21:04:55 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 25.488719ms -badger 2024/05/09 21:04:55 INFO: [Compactor: 173] Compaction for level: 0 DONE -badger 2024/05/09 21:04:55 INFO: Force compaction on level 0 done ---- PASS: Test_BasicGet_Succ (0.30s) +badger 2025/06/12 03:33:57 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:33:57 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:33:57 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:33:57 INFO: Storing value log head: {Fid:0 Len:29 Offset:150} +badger 2025/06/12 03:33:57 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 +badger 2025/06/12 03:33:57 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 61.407225ms +badger 2025/06/12 03:33:57 INFO: [Compactor: 173] Compaction for level: 0 DONE +badger 2025/06/12 03:33:57 INFO: Force compaction on level 0 done +--- PASS: Test_BasicGet_Succ (0.53s) === RUN Test_BasicGet_Failed_QueueNotFound -badger 2024/05/09 21:04:55 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:04:55 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:04:55 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:04:55 INFO: Storing value log head: {Fid:0 Len:29 Offset:182} -badger 2024/05/09 21:04:55 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 -badger 2024/05/09 21:04:55 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 29.433081ms -badger 2024/05/09 21:04:55 INFO: [Compactor: 173] Compaction for level: 0 DONE -badger 2024/05/09 21:04:55 INFO: Force compaction on level 0 done ---- PASS: Test_BasicGet_Failed_QueueNotFound (0.34s) +badger 2025/06/12 03:33:57 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:33:57 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:33:57 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:33:57 INFO: Storing value log head: {Fid:0 Len:29 Offset:182} +badger 2025/06/12 03:33:57 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 +badger 2025/06/12 03:33:57 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 7.761531ms +badger 2025/06/12 03:33:57 INFO: [Compactor: 173] Compaction for level: 0 DONE +badger 2025/06/12 03:33:57 INFO: Force compaction on level 0 done +--- PASS: Test_BasicGet_Failed_QueueNotFound (0.10s) === RUN Test_ChannelOpen_Success -badger 2024/05/09 21:04:55 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:04:55 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:04:55 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:04:56 INFO: Storing value log head: {Fid:0 Len:29 Offset:52} -badger 2024/05/09 21:04:56 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 -badger 2024/05/09 21:04:56 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 25.598955ms -badger 2024/05/09 21:04:56 INFO: [Compactor: 173] Compaction for level: 0 DONE -badger 2024/05/09 21:04:56 INFO: Force compaction on level 0 done ---- PASS: Test_ChannelOpen_Success (0.28s) +badger 2025/06/12 03:33:57 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:33:57 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:33:57 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:33:58 INFO: Storing value log head: {Fid:0 Len:29 Offset:52} +badger 2025/06/12 03:33:58 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 +badger 2025/06/12 03:33:58 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 8.290181ms +badger 2025/06/12 03:33:58 INFO: [Compactor: 173] Compaction for level: 0 DONE +badger 2025/06/12 03:33:58 INFO: Force compaction on level 0 done +--- PASS: Test_ChannelOpen_Success (0.07s) === RUN Test_ChannelOpen_FailedReopen -badger 2024/05/09 21:04:56 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:04:56 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:04:56 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:04:56 INFO: Storing value log head: {Fid:0 Len:29 Offset:52} -badger 2024/05/09 21:04:56 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 -badger 2024/05/09 21:04:56 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 32.111441ms -badger 2024/05/09 21:04:56 INFO: [Compactor: 173] Compaction for level: 0 DONE -badger 2024/05/09 21:04:56 INFO: Force compaction on level 0 done ---- PASS: Test_ChannelOpen_FailedReopen (0.32s) +badger 2025/06/12 03:33:58 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:33:58 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:33:58 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:33:58 INFO: Storing value log head: {Fid:0 Len:29 Offset:52} +badger 2025/06/12 03:33:58 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 +badger 2025/06/12 03:33:58 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 5.008855ms +badger 2025/06/12 03:33:58 INFO: [Compactor: 173] Compaction for level: 0 DONE +badger 2025/06/12 03:33:58 INFO: Force compaction on level 0 done +--- PASS: Test_ChannelOpen_FailedReopen (0.09s) === RUN Test_ChannelClose_Success -badger 2024/05/09 21:04:56 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:04:56 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:04:57 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:04:57 INFO: Storing value log head: {Fid:0 Len:29 Offset:52} -badger 2024/05/09 21:04:57 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 -badger 2024/05/09 21:04:57 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 25.484772ms -badger 2024/05/09 21:04:57 INFO: [Compactor: 173] Compaction for level: 0 DONE -badger 2024/05/09 21:04:57 INFO: Force compaction on level 0 done ---- PASS: Test_ChannelClose_Success (0.73s) +badger 2025/06/12 03:33:58 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:33:58 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:33:58 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:33:58 INFO: Storing value log head: {Fid:0 Len:29 Offset:52} +badger 2025/06/12 03:33:58 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 +badger 2025/06/12 03:33:58 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 6.391279ms +badger 2025/06/12 03:33:58 INFO: [Compactor: 173] Compaction for level: 0 DONE +badger 2025/06/12 03:33:58 INFO: Force compaction on level 0 done +--- PASS: Test_ChannelClose_Success (0.14s) === RUN Test_ChannelFlow_Active_Success -badger 2024/05/09 21:04:57 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:04:57 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:00 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:00 INFO: Storing value log head: {Fid:0 Len:29 Offset:52} -badger 2024/05/09 21:05:00 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 -badger 2024/05/09 21:05:00 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 20.412741ms -badger 2024/05/09 21:05:00 INFO: [Compactor: 173] Compaction for level: 0 DONE -badger 2024/05/09 21:05:00 INFO: Force compaction on level 0 done ---- PASS: Test_ChannelFlow_Active_Success (3.47s) +badger 2025/06/12 03:33:58 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:33:58 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:33:58 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:33:58 INFO: Storing value log head: {Fid:0 Len:29 Offset:52} +badger 2025/06/12 03:33:58 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 +badger 2025/06/12 03:33:58 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 43.341114ms +badger 2025/06/12 03:33:58 INFO: [Compactor: 173] Compaction for level: 0 DONE +badger 2025/06/12 03:33:58 INFO: Force compaction on level 0 done +--- PASS: Test_ChannelFlow_Active_Success (0.42s) === RUN Test_ChannelFlow_InActive_Success -badger 2024/05/09 21:05:00 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:00 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:00 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:00 INFO: Storing value log head: {Fid:0 Len:29 Offset:52} -badger 2024/05/09 21:05:00 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 -badger 2024/05/09 21:05:01 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 30.868597ms -badger 2024/05/09 21:05:01 INFO: [Compactor: 173] Compaction for level: 0 DONE -badger 2024/05/09 21:05:01 INFO: Force compaction on level 0 done ---- PASS: Test_ChannelFlow_InActive_Success (0.43s) +badger 2025/06/12 03:33:58 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:33:58 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:33:59 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:33:59 INFO: Storing value log head: {Fid:0 Len:29 Offset:52} +badger 2025/06/12 03:33:59 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 +badger 2025/06/12 03:33:59 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 8.097208ms +badger 2025/06/12 03:33:59 INFO: [Compactor: 173] Compaction for level: 0 DONE +badger 2025/06/12 03:33:59 INFO: Force compaction on level 0 done +--- PASS: Test_ChannelFlow_InActive_Success (0.63s) === RUN Test_ChannelFlow_Failed_FlowOkSend -badger 2024/05/09 21:05:01 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:01 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:01 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:01 INFO: Storing value log head: {Fid:0 Len:29 Offset:52} -badger 2024/05/09 21:05:01 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 -badger 2024/05/09 21:05:01 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 40.306764ms -badger 2024/05/09 21:05:01 INFO: [Compactor: 173] Compaction for level: 0 DONE -badger 2024/05/09 21:05:01 INFO: Force compaction on level 0 done ---- PASS: Test_ChannelFlow_Failed_FlowOkSend (0.78s) +badger 2025/06/12 03:33:59 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:33:59 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:33:59 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:33:59 INFO: Storing value log head: {Fid:0 Len:29 Offset:52} +badger 2025/06/12 03:33:59 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 +badger 2025/06/12 03:33:59 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 7.377717ms +badger 2025/06/12 03:33:59 INFO: [Compactor: 173] Compaction for level: 0 DONE +badger 2025/06/12 03:33:59 INFO: Force compaction on level 0 done +--- PASS: Test_ChannelFlow_Failed_FlowOkSend (0.17s) === RUN Test_Confirm_Success -badger 2024/05/09 21:05:01 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:01 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:02 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:02 INFO: Storing value log head: {Fid:0 Len:29 Offset:52} -badger 2024/05/09 21:05:02 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 -badger 2024/05/09 21:05:02 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 27.714126ms -badger 2024/05/09 21:05:02 INFO: [Compactor: 173] Compaction for level: 0 DONE -badger 2024/05/09 21:05:02 INFO: Force compaction on level 0 done ---- PASS: Test_Confirm_Success (0.33s) +badger 2025/06/12 03:33:59 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:33:59 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:33:59 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:33:59 INFO: Storing value log head: {Fid:0 Len:29 Offset:52} +badger 2025/06/12 03:33:59 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 +badger 2025/06/12 03:33:59 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 8.022343ms +badger 2025/06/12 03:33:59 INFO: [Compactor: 173] Compaction for level: 0 DONE +badger 2025/06/12 03:33:59 INFO: Force compaction on level 0 done +--- PASS: Test_Confirm_Success (0.12s) === RUN Test_ConfirmReceive_Acks_Success -badger 2024/05/09 21:05:02 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:02 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:02 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:02 INFO: Storing value log head: {Fid:0 Len:29 Offset:52} -badger 2024/05/09 21:05:02 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 -badger 2024/05/09 21:05:02 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 26.66236ms -badger 2024/05/09 21:05:02 INFO: [Compactor: 173] Compaction for level: 0 DONE -badger 2024/05/09 21:05:02 INFO: Force compaction on level 0 done ---- PASS: Test_ConfirmReceive_Acks_Success (0.31s) +badger 2025/06/12 03:33:59 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:33:59 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:33:59 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:33:59 INFO: Storing value log head: {Fid:0 Len:29 Offset:52} +badger 2025/06/12 03:33:59 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 +badger 2025/06/12 03:33:59 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 12.10823ms +badger 2025/06/12 03:33:59 INFO: [Compactor: 173] Compaction for level: 0 DONE +badger 2025/06/12 03:33:59 INFO: Force compaction on level 0 done +--- PASS: Test_ConfirmReceive_Acks_Success (0.14s) === RUN Test_ConfirmReceive_Acks_NoRoute_Success -badger 2024/05/09 21:05:02 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:02 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:02 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:02 INFO: Storing value log head: {Fid:0 Len:29 Offset:52} -badger 2024/05/09 21:05:02 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 -badger 2024/05/09 21:05:02 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 30.122357ms -badger 2024/05/09 21:05:02 INFO: [Compactor: 173] Compaction for level: 0 DONE -badger 2024/05/09 21:05:02 INFO: Force compaction on level 0 done ---- PASS: Test_ConfirmReceive_Acks_NoRoute_Success (0.30s) +badger 2025/06/12 03:33:59 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:33:59 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:33:59 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:33:59 INFO: Storing value log head: {Fid:0 Len:29 Offset:52} +badger 2025/06/12 03:33:59 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 +badger 2025/06/12 03:33:59 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 7.955661ms +badger 2025/06/12 03:33:59 INFO: [Compactor: 173] Compaction for level: 0 DONE +badger 2025/06/12 03:33:59 INFO: Force compaction on level 0 done +--- PASS: Test_ConfirmReceive_Acks_NoRoute_Success (0.14s) === RUN Test_ConfirmReceive_Acks_Persistent_Success -badger 2024/05/09 21:05:02 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:02 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:02 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:03 INFO: Storing value log head: {Fid:0 Len:29 Offset:1770} -badger 2024/05/09 21:05:03 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 -badger 2024/05/09 21:05:03 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 22.709305ms -badger 2024/05/09 21:05:03 INFO: [Compactor: 173] Compaction for level: 0 DONE -badger 2024/05/09 21:05:03 INFO: Force compaction on level 0 done -badger 2024/05/09 21:05:03 INFO: Storing value log head: {Fid:0 Len:29 Offset:200} -badger 2024/05/09 21:05:03 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 -badger 2024/05/09 21:05:03 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 27.657174ms -badger 2024/05/09 21:05:03 INFO: [Compactor: 173] Compaction for level: 0 DONE -badger 2024/05/09 21:05:03 INFO: Force compaction on level 0 done ---- PASS: Test_ConfirmReceive_Acks_Persistent_Success (0.35s) +badger 2025/06/12 03:33:59 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:33:59 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:33:59 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:33:59 INFO: Storing value log head: {Fid:0 Len:29 Offset:1770} +badger 2025/06/12 03:33:59 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 +badger 2025/06/12 03:33:59 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 6.841008ms +badger 2025/06/12 03:33:59 INFO: [Compactor: 173] Compaction for level: 0 DONE +badger 2025/06/12 03:33:59 INFO: Force compaction on level 0 done +badger 2025/06/12 03:34:00 INFO: Storing value log head: {Fid:0 Len:29 Offset:200} +badger 2025/06/12 03:34:00 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 +badger 2025/06/12 03:34:00 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 7.753761ms +badger 2025/06/12 03:34:00 INFO: [Compactor: 173] Compaction for level: 0 DONE +badger 2025/06/12 03:34:00 INFO: Force compaction on level 0 done +--- PASS: Test_ConfirmReceive_Acks_Persistent_Success (0.14s) === RUN Test_Connection_Success -badger 2024/05/09 21:05:03 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:03 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:03 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:04 INFO: Storing value log head: {Fid:0 Len:29 Offset:52} -badger 2024/05/09 21:05:06 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 -badger 2024/05/09 21:05:06 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 27.850388ms -badger 2024/05/09 21:05:06 INFO: [Compactor: 173] Compaction for level: 0 DONE -badger 2024/05/09 21:05:06 INFO: Force compaction on level 0 done ---- PASS: Test_Connection_Success (3.73s) +badger 2025/06/12 03:34:00 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:34:00 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:34:00 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:34:00 INFO: Storing value log head: {Fid:0 Len:29 Offset:52} +badger 2025/06/12 03:34:00 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 +badger 2025/06/12 03:34:00 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 6.245054ms +badger 2025/06/12 03:34:00 INFO: [Compactor: 173] Compaction for level: 0 DONE +badger 2025/06/12 03:34:00 INFO: Force compaction on level 0 done +--- PASS: Test_Connection_Success (0.09s) === RUN Test_Connection_FailedVhostAccess -badger 2024/05/09 21:05:06 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:08 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:11 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:14 INFO: Storing value log head: {Fid:0 Len:29 Offset:55} -badger 2024/05/09 21:05:15 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 -badger 2024/05/09 21:05:16 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 871.628018ms -badger 2024/05/09 21:05:16 INFO: [Compactor: 173] Compaction for level: 0 DONE -badger 2024/05/09 21:05:16 INFO: Force compaction on level 0 done ---- PASS: Test_Connection_FailedVhostAccess (9.59s) +badger 2025/06/12 03:34:00 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:34:00 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:34:00 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:34:00 INFO: Storing value log head: {Fid:0 Len:29 Offset:55} +badger 2025/06/12 03:34:00 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 +badger 2025/06/12 03:34:00 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 6.933973ms +badger 2025/06/12 03:34:00 INFO: [Compactor: 173] Compaction for level: 0 DONE +badger 2025/06/12 03:34:00 INFO: Force compaction on level 0 done +--- PASS: Test_Connection_FailedVhostAccess (0.09s) === RUN Test_Connection_Failed_WhenWrongAuth -badger 2024/05/09 21:05:16 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:16 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:16 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:16 INFO: Storing value log head: {Fid:0 Len:29 Offset:52} -badger 2024/05/09 21:05:16 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 -badger 2024/05/09 21:05:16 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 24.486721ms -badger 2024/05/09 21:05:16 INFO: [Compactor: 173] Compaction for level: 0 DONE -badger 2024/05/09 21:05:16 INFO: Force compaction on level 0 done ---- PASS: Test_Connection_Failed_WhenWrongAuth (0.36s) +badger 2025/06/12 03:34:00 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:34:00 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:34:00 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:34:00 INFO: Storing value log head: {Fid:0 Len:29 Offset:52} +badger 2025/06/12 03:34:00 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 +badger 2025/06/12 03:34:00 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 4.809109ms +badger 2025/06/12 03:34:00 INFO: [Compactor: 173] Compaction for level: 0 DONE +badger 2025/06/12 03:34:00 INFO: Force compaction on level 0 done +--- PASS: Test_Connection_Failed_WhenWrongAuth (0.23s) === RUN Test_Connection_Failed_WhenWrongAuth_UnknownUser -badger 2024/05/09 21:05:16 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:16 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:16 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:17 INFO: Storing value log head: {Fid:0 Len:29 Offset:52} -badger 2024/05/09 21:05:17 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 -badger 2024/05/09 21:05:17 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 33.231059ms -badger 2024/05/09 21:05:17 INFO: [Compactor: 173] Compaction for level: 0 DONE -badger 2024/05/09 21:05:17 INFO: Force compaction on level 0 done ---- PASS: Test_Connection_Failed_WhenWrongAuth_UnknownUser (0.35s) +badger 2025/06/12 03:34:00 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:34:00 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:34:00 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:34:00 INFO: Storing value log head: {Fid:0 Len:29 Offset:52} +badger 2025/06/12 03:34:00 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 +badger 2025/06/12 03:34:00 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 5.912909ms +badger 2025/06/12 03:34:00 INFO: [Compactor: 173] Compaction for level: 0 DONE +badger 2025/06/12 03:34:00 INFO: Force compaction on level 0 done +--- PASS: Test_Connection_Failed_WhenWrongAuth_UnknownUser (0.39s) === RUN Test_DefaultExchanges -badger 2024/05/09 21:05:17 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:17 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:17 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:17 INFO: Storing value log head: {Fid:0 Len:29 Offset:52} -badger 2024/05/09 21:05:17 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 -badger 2024/05/09 21:05:17 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 329.517764ms -badger 2024/05/09 21:05:17 INFO: [Compactor: 173] Compaction for level: 0 DONE -badger 2024/05/09 21:05:17 INFO: Force compaction on level 0 done ---- PASS: Test_DefaultExchanges (0.59s) +badger 2025/06/12 03:34:00 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:34:00 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:34:00 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:34:00 INFO: Storing value log head: {Fid:0 Len:29 Offset:52} +badger 2025/06/12 03:34:00 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 +badger 2025/06/12 03:34:00 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 5.577764ms +badger 2025/06/12 03:34:00 INFO: [Compactor: 173] Compaction for level: 0 DONE +badger 2025/06/12 03:34:00 INFO: Force compaction on level 0 done +--- PASS: Test_DefaultExchanges (0.09s) === RUN Test_ExchangeDeclare_Success -badger 2024/05/09 21:05:17 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:17 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:17 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:17 INFO: Storing value log head: {Fid:0 Len:29 Offset:52} -badger 2024/05/09 21:05:17 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 -badger 2024/05/09 21:05:18 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 27.724859ms -badger 2024/05/09 21:05:18 INFO: [Compactor: 173] Compaction for level: 0 DONE -badger 2024/05/09 21:05:18 INFO: Force compaction on level 0 done ---- PASS: Test_ExchangeDeclare_Success (0.30s) +badger 2025/06/12 03:34:00 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:34:00 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:34:00 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:34:00 INFO: Storing value log head: {Fid:0 Len:29 Offset:52} +badger 2025/06/12 03:34:00 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 +badger 2025/06/12 03:34:00 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 5.601251ms +badger 2025/06/12 03:34:00 INFO: [Compactor: 173] Compaction for level: 0 DONE +badger 2025/06/12 03:34:00 INFO: Force compaction on level 0 done +--- PASS: Test_ExchangeDeclare_Success (0.09s) === RUN Test_ExchangeDeclareDurable_Success -badger 2024/05/09 21:05:18 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:18 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:18 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:18 INFO: Storing value log head: {Fid:0 Len:29 Offset:125} -badger 2024/05/09 21:05:18 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 -badger 2024/05/09 21:05:18 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 29.877989ms -badger 2024/05/09 21:05:18 INFO: [Compactor: 173] Compaction for level: 0 DONE -badger 2024/05/09 21:05:18 INFO: Force compaction on level 0 done ---- PASS: Test_ExchangeDeclareDurable_Success (0.34s) +badger 2025/06/12 03:34:01 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:34:01 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:34:01 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:34:01 INFO: Storing value log head: {Fid:0 Len:29 Offset:125} +badger 2025/06/12 03:34:01 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 +badger 2025/06/12 03:34:01 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 6.696044ms +badger 2025/06/12 03:34:01 INFO: [Compactor: 173] Compaction for level: 0 DONE +badger 2025/06/12 03:34:01 INFO: Force compaction on level 0 done +--- PASS: Test_ExchangeDeclareDurable_Success (0.11s) === RUN Test_ExchangeDeclare_Success_RedeclareEqual -badger 2024/05/09 21:05:18 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:18 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:18 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:18 INFO: Storing value log head: {Fid:0 Len:29 Offset:52} -badger 2024/05/09 21:05:18 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 -badger 2024/05/09 21:05:18 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 37.783291ms -badger 2024/05/09 21:05:18 INFO: [Compactor: 173] Compaction for level: 0 DONE -badger 2024/05/09 21:05:18 INFO: Force compaction on level 0 done ---- PASS: Test_ExchangeDeclare_Success_RedeclareEqual (0.31s) +badger 2025/06/12 03:34:01 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:34:01 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:34:01 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:34:01 INFO: Storing value log head: {Fid:0 Len:29 Offset:52} +badger 2025/06/12 03:34:01 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 +badger 2025/06/12 03:34:01 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 5.094011ms +badger 2025/06/12 03:34:01 INFO: [Compactor: 173] Compaction for level: 0 DONE +badger 2025/06/12 03:34:01 INFO: Force compaction on level 0 done +--- PASS: Test_ExchangeDeclare_Success_RedeclareEqual (0.09s) === RUN Test_ExchangeDeclare_Failed_WrongType -badger 2024/05/09 21:05:18 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:18 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:18 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:18 INFO: Storing value log head: {Fid:0 Len:29 Offset:52} -badger 2024/05/09 21:05:18 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 -badger 2024/05/09 21:05:19 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 30.081844ms -badger 2024/05/09 21:05:19 INFO: [Compactor: 173] Compaction for level: 0 DONE -badger 2024/05/09 21:05:19 INFO: Force compaction on level 0 done ---- PASS: Test_ExchangeDeclare_Failed_WrongType (0.31s) +badger 2025/06/12 03:34:01 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:34:01 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:34:01 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:34:01 INFO: Storing value log head: {Fid:0 Len:29 Offset:52} +badger 2025/06/12 03:34:01 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 +badger 2025/06/12 03:34:01 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 7.631985ms +badger 2025/06/12 03:34:01 INFO: [Compactor: 173] Compaction for level: 0 DONE +badger 2025/06/12 03:34:01 INFO: Force compaction on level 0 done +--- PASS: Test_ExchangeDeclare_Failed_WrongType (0.16s) === RUN Test_ExchangeDeclare_Failed_RedeclareNotEqual -badger 2024/05/09 21:05:19 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:19 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:19 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:19 INFO: Storing value log head: {Fid:0 Len:29 Offset:52} -badger 2024/05/09 21:05:19 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 -badger 2024/05/09 21:05:19 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 20.733771ms -badger 2024/05/09 21:05:19 INFO: [Compactor: 173] Compaction for level: 0 DONE -badger 2024/05/09 21:05:19 INFO: Force compaction on level 0 done ---- PASS: Test_ExchangeDeclare_Failed_RedeclareNotEqual (0.25s) +badger 2025/06/12 03:34:01 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:34:01 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:34:01 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:34:01 INFO: Storing value log head: {Fid:0 Len:29 Offset:52} +badger 2025/06/12 03:34:01 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 +badger 2025/06/12 03:34:01 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 4.540455ms +badger 2025/06/12 03:34:01 INFO: [Compactor: 173] Compaction for level: 0 DONE +badger 2025/06/12 03:34:01 INFO: Force compaction on level 0 done +--- PASS: Test_ExchangeDeclare_Failed_RedeclareNotEqual (0.09s) === RUN Test_ExchangeDeclare_Failed_EmptyName -badger 2024/05/09 21:05:19 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:19 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:19 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:19 INFO: Storing value log head: {Fid:0 Len:29 Offset:52} -badger 2024/05/09 21:05:19 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 -badger 2024/05/09 21:05:19 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 28.972205ms -badger 2024/05/09 21:05:19 INFO: [Compactor: 173] Compaction for level: 0 DONE -badger 2024/05/09 21:05:19 INFO: Force compaction on level 0 done ---- PASS: Test_ExchangeDeclare_Failed_EmptyName (0.23s) +badger 2025/06/12 03:34:01 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:34:01 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:34:01 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:34:01 INFO: Storing value log head: {Fid:0 Len:29 Offset:52} +badger 2025/06/12 03:34:01 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 +badger 2025/06/12 03:34:01 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 9.161973ms +badger 2025/06/12 03:34:01 INFO: [Compactor: 173] Compaction for level: 0 DONE +badger 2025/06/12 03:34:01 INFO: Force compaction on level 0 done +--- PASS: Test_ExchangeDeclare_Failed_EmptyName (0.46s) === RUN Test_ExchangeDeclare_Failed_DefaultName -badger 2024/05/09 21:05:19 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:19 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:19 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:19 INFO: Storing value log head: {Fid:0 Len:29 Offset:52} -badger 2024/05/09 21:05:19 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 -badger 2024/05/09 21:05:19 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 20.960485ms -badger 2024/05/09 21:05:19 INFO: [Compactor: 173] Compaction for level: 0 DONE -badger 2024/05/09 21:05:19 INFO: Force compaction on level 0 done ---- PASS: Test_ExchangeDeclare_Failed_DefaultName (0.22s) +badger 2025/06/12 03:34:01 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:34:01 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:34:01 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:34:02 INFO: Storing value log head: {Fid:0 Len:29 Offset:52} +badger 2025/06/12 03:34:02 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 +badger 2025/06/12 03:34:02 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 10.910663ms +badger 2025/06/12 03:34:02 INFO: [Compactor: 173] Compaction for level: 0 DONE +badger 2025/06/12 03:34:02 INFO: Force compaction on level 0 done +--- PASS: Test_ExchangeDeclare_Failed_DefaultName (0.13s) === RUN Test_ExchangeDeclarePassive_Success -badger 2024/05/09 21:05:19 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:19 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:19 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:19 INFO: Storing value log head: {Fid:0 Len:29 Offset:52} -badger 2024/05/09 21:05:19 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 -badger 2024/05/09 21:05:19 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 24.235603ms -badger 2024/05/09 21:05:19 INFO: [Compactor: 173] Compaction for level: 0 DONE -badger 2024/05/09 21:05:19 INFO: Force compaction on level 0 done ---- PASS: Test_ExchangeDeclarePassive_Success (0.28s) +badger 2025/06/12 03:34:02 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:34:02 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:34:02 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:34:02 INFO: Storing value log head: {Fid:0 Len:29 Offset:52} +badger 2025/06/12 03:34:02 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 +badger 2025/06/12 03:34:02 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 7.072715ms +badger 2025/06/12 03:34:02 INFO: [Compactor: 173] Compaction for level: 0 DONE +badger 2025/06/12 03:34:02 INFO: Force compaction on level 0 done +--- PASS: Test_ExchangeDeclarePassive_Success (0.11s) === RUN Test_ExchangeDeclarePassive_Failed_NotExists -badger 2024/05/09 21:05:20 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:20 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:20 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:20 INFO: Storing value log head: {Fid:0 Len:29 Offset:52} -badger 2024/05/09 21:05:20 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 -badger 2024/05/09 21:05:20 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 34.534129ms -badger 2024/05/09 21:05:20 INFO: [Compactor: 173] Compaction for level: 0 DONE -badger 2024/05/09 21:05:20 INFO: Force compaction on level 0 done ---- PASS: Test_ExchangeDeclarePassive_Failed_NotExists (0.68s) +badger 2025/06/12 03:34:02 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:34:02 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:34:02 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:34:02 INFO: Storing value log head: {Fid:0 Len:29 Offset:52} +badger 2025/06/12 03:34:02 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 +badger 2025/06/12 03:34:02 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 8.449744ms +badger 2025/06/12 03:34:02 INFO: [Compactor: 173] Compaction for level: 0 DONE +badger 2025/06/12 03:34:02 INFO: Force compaction on level 0 done +--- PASS: Test_ExchangeDeclarePassive_Failed_NotExists (0.22s) === RUN Test_ServerPersist_Queue_Success -badger 2024/05/09 21:05:20 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:20 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:20 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:21 INFO: Storing value log head: {Fid:0 Len:29 Offset:178} -badger 2024/05/09 21:05:21 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 -badger 2024/05/09 21:05:21 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 25.392979ms -badger 2024/05/09 21:05:21 INFO: [Compactor: 173] Compaction for level: 0 DONE -badger 2024/05/09 21:05:21 INFO: Force compaction on level 0 done -badger 2024/05/09 21:05:21 INFO: All 1 tables opened in 0s -badger 2024/05/09 21:05:21 INFO: Replaying file id: 0 at offset: 207 -badger 2024/05/09 21:05:21 INFO: Replay took: 3.99µs -badger 2024/05/09 21:05:21 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:21 INFO: Replaying file id: 0 at offset: 0 -badger 2024/05/09 21:05:21 INFO: Replay took: 5.194µs -badger 2024/05/09 21:05:21 INFO: All 0 tables opened in 0s ---- PASS: Test_ServerPersist_Queue_Success (0.59s) +badger 2025/06/12 03:34:02 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:34:02 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:34:02 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:34:02 INFO: Storing value log head: {Fid:0 Len:29 Offset:178} +badger 2025/06/12 03:34:02 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 +badger 2025/06/12 03:34:02 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 39.301801ms +badger 2025/06/12 03:34:02 INFO: [Compactor: 173] Compaction for level: 0 DONE +badger 2025/06/12 03:34:02 INFO: Force compaction on level 0 done +badger 2025/06/12 03:34:02 INFO: All 1 tables opened in 0s +badger 2025/06/12 03:34:02 INFO: Replaying file id: 0 at offset: 207 +badger 2025/06/12 03:34:02 INFO: Replay took: 5.633µs +badger 2025/06/12 03:34:02 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:34:02 INFO: Replaying file id: 0 at offset: 0 +badger 2025/06/12 03:34:02 INFO: Replay took: 3.698µs +badger 2025/06/12 03:34:02 INFO: All 0 tables opened in 0s +--- PASS: Test_ServerPersist_Queue_Success (0.35s) === RUN Test_ServerPersist_Exchange_Success -badger 2024/05/09 21:05:21 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:21 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:21 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:21 INFO: Storing value log head: {Fid:0 Len:29 Offset:228} -badger 2024/05/09 21:05:21 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 -badger 2024/05/09 21:05:21 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 31.230397ms -badger 2024/05/09 21:05:21 INFO: [Compactor: 173] Compaction for level: 0 DONE -badger 2024/05/09 21:05:21 INFO: Force compaction on level 0 done -badger 2024/05/09 21:05:21 INFO: All 1 tables opened in 0s -badger 2024/05/09 21:05:21 INFO: Replaying file id: 0 at offset: 257 -badger 2024/05/09 21:05:21 INFO: Replay took: 5.785µs -badger 2024/05/09 21:05:21 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:21 INFO: Replaying file id: 0 at offset: 0 -badger 2024/05/09 21:05:21 INFO: Replay took: 5.289µs -badger 2024/05/09 21:05:21 INFO: All 0 tables opened in 0s ---- PASS: Test_ServerPersist_Exchange_Success (0.70s) +badger 2025/06/12 03:34:02 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:34:02 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:34:02 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:34:02 INFO: Storing value log head: {Fid:0 Len:29 Offset:228} +badger 2025/06/12 03:34:02 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 +badger 2025/06/12 03:34:02 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 5.271327ms +badger 2025/06/12 03:34:02 INFO: [Compactor: 173] Compaction for level: 0 DONE +badger 2025/06/12 03:34:02 INFO: Force compaction on level 0 done +badger 2025/06/12 03:34:02 INFO: All 1 tables opened in 0s +badger 2025/06/12 03:34:02 INFO: Replaying file id: 0 at offset: 257 +badger 2025/06/12 03:34:02 INFO: Replay took: 3.553µs +badger 2025/06/12 03:34:02 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:34:02 INFO: Replaying file id: 0 at offset: 0 +badger 2025/06/12 03:34:02 INFO: Replay took: 3.635µs +badger 2025/06/12 03:34:02 INFO: All 0 tables opened in 0s +--- PASS: Test_ServerPersist_Exchange_Success (0.30s) === RUN Test_QueueDeclare_Success -badger 2024/05/09 21:05:22 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:22 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:22 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:22 INFO: Storing value log head: {Fid:0 Len:29 Offset:52} -badger 2024/05/09 21:05:22 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 -badger 2024/05/09 21:05:22 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 35.229852ms -badger 2024/05/09 21:05:22 INFO: [Compactor: 173] Compaction for level: 0 DONE -badger 2024/05/09 21:05:22 INFO: Force compaction on level 0 done ---- PASS: Test_QueueDeclare_Success (0.44s) +badger 2025/06/12 03:34:03 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:34:03 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:34:03 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:34:03 INFO: Storing value log head: {Fid:0 Len:29 Offset:52} +badger 2025/06/12 03:34:03 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 +badger 2025/06/12 03:34:03 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 15.782351ms +badger 2025/06/12 03:34:03 INFO: [Compactor: 173] Compaction for level: 0 DONE +badger 2025/06/12 03:34:03 INFO: Force compaction on level 0 done +--- PASS: Test_QueueDeclare_Success (0.30s) === RUN Test_QueueDeclareDurable_Success -badger 2024/05/09 21:05:22 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:22 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:22 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:22 INFO: Storing value log head: {Fid:0 Len:29 Offset:178} -badger 2024/05/09 21:05:22 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 -badger 2024/05/09 21:05:22 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 25.636021ms -badger 2024/05/09 21:05:22 INFO: [Compactor: 173] Compaction for level: 0 DONE -badger 2024/05/09 21:05:22 INFO: Force compaction on level 0 done ---- PASS: Test_QueueDeclareDurable_Success (0.46s) +badger 2025/06/12 03:34:03 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:34:03 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:34:03 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:34:03 INFO: Storing value log head: {Fid:0 Len:29 Offset:178} +badger 2025/06/12 03:34:03 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 +badger 2025/06/12 03:34:03 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 8.701906ms +badger 2025/06/12 03:34:03 INFO: [Compactor: 173] Compaction for level: 0 DONE +badger 2025/06/12 03:34:03 INFO: Force compaction on level 0 done +--- PASS: Test_QueueDeclareDurable_Success (0.21s) === RUN Test_QueueDeclare_HasDefaultRoute -badger 2024/05/09 21:05:22 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:23 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:23 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:23 INFO: Storing value log head: {Fid:0 Len:29 Offset:52} -badger 2024/05/09 21:05:23 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 -badger 2024/05/09 21:05:23 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 115.003014ms -badger 2024/05/09 21:05:23 INFO: [Compactor: 173] Compaction for level: 0 DONE -badger 2024/05/09 21:05:23 INFO: Force compaction on level 0 done ---- PASS: Test_QueueDeclare_HasDefaultRoute (0.61s) +badger 2025/06/12 03:34:03 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:34:03 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:34:03 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:34:03 INFO: Storing value log head: {Fid:0 Len:29 Offset:52} +badger 2025/06/12 03:34:03 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 +badger 2025/06/12 03:34:03 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 3.907533ms +badger 2025/06/12 03:34:03 INFO: [Compactor: 173] Compaction for level: 0 DONE +badger 2025/06/12 03:34:03 INFO: Force compaction on level 0 done +--- PASS: Test_QueueDeclare_HasDefaultRoute (0.19s) === RUN Test_QueueDeclare_Success_RedeclareEqual -badger 2024/05/09 21:05:23 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:23 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:24 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:24 INFO: Storing value log head: {Fid:0 Len:29 Offset:52} -badger 2024/05/09 21:05:24 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 -badger 2024/05/09 21:05:24 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 38.944026ms -badger 2024/05/09 21:05:24 INFO: [Compactor: 173] Compaction for level: 0 DONE -badger 2024/05/09 21:05:24 INFO: Force compaction on level 0 done ---- PASS: Test_QueueDeclare_Success_RedeclareEqual (0.81s) +badger 2025/06/12 03:34:03 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:34:03 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:34:03 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:34:03 INFO: Storing value log head: {Fid:0 Len:29 Offset:52} +badger 2025/06/12 03:34:03 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 +badger 2025/06/12 03:34:03 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 7.124643ms +badger 2025/06/12 03:34:03 INFO: [Compactor: 173] Compaction for level: 0 DONE +badger 2025/06/12 03:34:03 INFO: Force compaction on level 0 done +--- PASS: Test_QueueDeclare_Success_RedeclareEqual (0.16s) === RUN Test_QueueDeclare_Failed_RedeclareNotEqual -badger 2024/05/09 21:05:24 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:24 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:24 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:24 INFO: Storing value log head: {Fid:0 Len:29 Offset:52} -badger 2024/05/09 21:05:24 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 -badger 2024/05/09 21:05:25 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 73.524864ms -badger 2024/05/09 21:05:25 INFO: [Compactor: 173] Compaction for level: 0 DONE -badger 2024/05/09 21:05:25 INFO: Force compaction on level 0 done ---- PASS: Test_QueueDeclare_Failed_RedeclareNotEqual (0.76s) +badger 2025/06/12 03:34:03 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:34:03 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:34:03 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:34:03 INFO: Storing value log head: {Fid:0 Len:29 Offset:52} +badger 2025/06/12 03:34:03 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 +badger 2025/06/12 03:34:03 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 6.923843ms +badger 2025/06/12 03:34:03 INFO: [Compactor: 173] Compaction for level: 0 DONE +badger 2025/06/12 03:34:03 INFO: Force compaction on level 0 done +--- PASS: Test_QueueDeclare_Failed_RedeclareNotEqual (0.13s) === RUN Test_QueueDeclare_Failed_EmptyName -badger 2024/05/09 21:05:25 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:25 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:25 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:25 INFO: Storing value log head: {Fid:0 Len:29 Offset:52} -badger 2024/05/09 21:05:25 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 -badger 2024/05/09 21:05:25 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 46.858998ms -badger 2024/05/09 21:05:25 INFO: [Compactor: 173] Compaction for level: 0 DONE -badger 2024/05/09 21:05:25 INFO: Force compaction on level 0 done ---- PASS: Test_QueueDeclare_Failed_EmptyName (0.65s) +badger 2025/06/12 03:34:03 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:34:04 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:34:04 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:34:04 INFO: Storing value log head: {Fid:0 Len:29 Offset:52} +badger 2025/06/12 03:34:04 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 +badger 2025/06/12 03:34:04 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 7.578676ms +badger 2025/06/12 03:34:04 INFO: [Compactor: 173] Compaction for level: 0 DONE +badger 2025/06/12 03:34:04 INFO: Force compaction on level 0 done +--- PASS: Test_QueueDeclare_Failed_EmptyName (0.09s) === RUN Test_QueueDeclarePassive_Success -badger 2024/05/09 21:05:25 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:25 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:25 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:25 INFO: Storing value log head: {Fid:0 Len:29 Offset:52} -badger 2024/05/09 21:05:25 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 -badger 2024/05/09 21:05:25 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 31.589724ms -badger 2024/05/09 21:05:25 INFO: [Compactor: 173] Compaction for level: 0 DONE -badger 2024/05/09 21:05:25 INFO: Force compaction on level 0 done ---- PASS: Test_QueueDeclarePassive_Success (0.29s) +badger 2025/06/12 03:34:04 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:34:04 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:34:04 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:34:04 INFO: Storing value log head: {Fid:0 Len:29 Offset:52} +badger 2025/06/12 03:34:04 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 +badger 2025/06/12 03:34:04 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 7.34042ms +badger 2025/06/12 03:34:04 INFO: [Compactor: 173] Compaction for level: 0 DONE +badger 2025/06/12 03:34:04 INFO: Force compaction on level 0 done +--- PASS: Test_QueueDeclarePassive_Success (0.08s) === RUN Test_QueueDeclarePassive_Failed_NotExists -badger 2024/05/09 21:05:26 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:26 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:26 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:26 INFO: Storing value log head: {Fid:0 Len:29 Offset:52} -badger 2024/05/09 21:05:26 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 -badger 2024/05/09 21:05:26 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 22.732818ms -badger 2024/05/09 21:05:26 INFO: [Compactor: 173] Compaction for level: 0 DONE -badger 2024/05/09 21:05:26 INFO: Force compaction on level 0 done ---- PASS: Test_QueueDeclarePassive_Failed_NotExists (0.27s) +badger 2025/06/12 03:34:04 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:34:04 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:34:04 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:34:04 INFO: Storing value log head: {Fid:0 Len:29 Offset:52} +badger 2025/06/12 03:34:04 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 +badger 2025/06/12 03:34:04 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 13.042146ms +badger 2025/06/12 03:34:04 INFO: [Compactor: 173] Compaction for level: 0 DONE +badger 2025/06/12 03:34:04 INFO: Force compaction on level 0 done +--- PASS: Test_QueueDeclarePassive_Failed_NotExists (0.10s) === RUN Test_QueueDeclarePassive_Failed_Locked -badger 2024/05/09 21:05:26 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:26 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:27 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:27 INFO: Storing value log head: {Fid:0 Len:29 Offset:290} -badger 2024/05/09 21:05:27 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 -badger 2024/05/09 21:05:27 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 23.79993ms -badger 2024/05/09 21:05:27 INFO: [Compactor: 173] Compaction for level: 0 DONE -badger 2024/05/09 21:05:27 INFO: Force compaction on level 0 done ---- PASS: Test_QueueDeclarePassive_Failed_Locked (0.96s) +badger 2025/06/12 03:34:04 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:34:04 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:34:04 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:34:04 INFO: Storing value log head: {Fid:0 Len:29 Offset:290} +badger 2025/06/12 03:34:04 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 +badger 2025/06/12 03:34:04 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 11.661729ms +badger 2025/06/12 03:34:04 INFO: [Compactor: 173] Compaction for level: 0 DONE +badger 2025/06/12 03:34:04 INFO: Force compaction on level 0 done +--- PASS: Test_QueueDeclarePassive_Failed_Locked (0.09s) === RUN Test_QueueDeclareExclusive_Success -badger 2024/05/09 21:05:27 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:27 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:27 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:27 INFO: Storing value log head: {Fid:0 Len:29 Offset:278} -badger 2024/05/09 21:05:27 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 -badger 2024/05/09 21:05:27 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 24.897369ms -badger 2024/05/09 21:05:27 INFO: [Compactor: 173] Compaction for level: 0 DONE -badger 2024/05/09 21:05:27 INFO: Force compaction on level 0 done ---- PASS: Test_QueueDeclareExclusive_Success (0.32s) +badger 2025/06/12 03:34:04 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:34:04 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:34:04 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:34:04 INFO: Storing value log head: {Fid:0 Len:29 Offset:278} +badger 2025/06/12 03:34:04 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 +badger 2025/06/12 03:34:04 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 7.608454ms +badger 2025/06/12 03:34:04 INFO: [Compactor: 173] Compaction for level: 0 DONE +badger 2025/06/12 03:34:04 INFO: Force compaction on level 0 done +--- PASS: Test_QueueDeclareExclusive_Success (0.21s) === RUN Test_QueueDeclareExclusive_Failed_Locked -badger 2024/05/09 21:05:27 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:27 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:27 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:27 INFO: Storing value log head: {Fid:0 Len:29 Offset:296} -badger 2024/05/09 21:05:27 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 -badger 2024/05/09 21:05:27 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 21.78863ms -badger 2024/05/09 21:05:27 INFO: [Compactor: 173] Compaction for level: 0 DONE -badger 2024/05/09 21:05:27 INFO: Force compaction on level 0 done ---- PASS: Test_QueueDeclareExclusive_Failed_Locked (0.33s) +badger 2025/06/12 03:34:04 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:34:04 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:34:04 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:34:04 INFO: Storing value log head: {Fid:0 Len:29 Offset:296} +badger 2025/06/12 03:34:04 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 +badger 2025/06/12 03:34:04 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 8.111754ms +badger 2025/06/12 03:34:04 INFO: [Compactor: 173] Compaction for level: 0 DONE +badger 2025/06/12 03:34:04 INFO: Force compaction on level 0 done +--- PASS: Test_QueueDeclareExclusive_Failed_Locked (0.10s) === RUN Test_QueueDeclareNotExclusive_Success -badger 2024/05/09 21:05:27 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:27 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:28 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:28 INFO: Storing value log head: {Fid:0 Len:29 Offset:52} -badger 2024/05/09 21:05:28 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 -badger 2024/05/09 21:05:28 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 24.287196ms -badger 2024/05/09 21:05:28 INFO: [Compactor: 173] Compaction for level: 0 DONE -badger 2024/05/09 21:05:28 INFO: Force compaction on level 0 done ---- PASS: Test_QueueDeclareNotExclusive_Success (0.27s) +badger 2025/06/12 03:34:04 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:34:04 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:34:04 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:34:04 INFO: Storing value log head: {Fid:0 Len:29 Offset:52} +badger 2025/06/12 03:34:04 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 +badger 2025/06/12 03:34:04 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 7.048672ms +badger 2025/06/12 03:34:04 INFO: [Compactor: 173] Compaction for level: 0 DONE +badger 2025/06/12 03:34:04 INFO: Force compaction on level 0 done +--- PASS: Test_QueueDeclareNotExclusive_Success (0.07s) === RUN Test_QueueBind_Success -badger 2024/05/09 21:05:28 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:28 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:28 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:28 INFO: Storing value log head: {Fid:0 Len:29 Offset:52} -badger 2024/05/09 21:05:28 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 -badger 2024/05/09 21:05:28 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 22.918221ms -badger 2024/05/09 21:05:28 INFO: [Compactor: 173] Compaction for level: 0 DONE -badger 2024/05/09 21:05:28 INFO: Force compaction on level 0 done ---- PASS: Test_QueueBind_Success (0.23s) +badger 2025/06/12 03:34:04 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:34:04 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:34:04 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:34:04 INFO: Storing value log head: {Fid:0 Len:29 Offset:52} +badger 2025/06/12 03:34:04 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 +badger 2025/06/12 03:34:04 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 7.55188ms +badger 2025/06/12 03:34:04 INFO: [Compactor: 173] Compaction for level: 0 DONE +badger 2025/06/12 03:34:04 INFO: Force compaction on level 0 done +--- PASS: Test_QueueBind_Success (0.21s) === RUN Test_QueueBind_Success_Rebind -badger 2024/05/09 21:05:28 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:28 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:28 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:28 INFO: Storing value log head: {Fid:0 Len:29 Offset:52} -badger 2024/05/09 21:05:28 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 -badger 2024/05/09 21:05:28 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 26.583904ms -badger 2024/05/09 21:05:28 INFO: [Compactor: 173] Compaction for level: 0 DONE -badger 2024/05/09 21:05:28 INFO: Force compaction on level 0 done ---- PASS: Test_QueueBind_Success_Rebind (0.25s) +badger 2025/06/12 03:34:04 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:34:04 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:34:04 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:34:05 INFO: Storing value log head: {Fid:0 Len:29 Offset:52} +badger 2025/06/12 03:34:05 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 +badger 2025/06/12 03:34:05 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 8.560855ms +badger 2025/06/12 03:34:05 INFO: [Compactor: 173] Compaction for level: 0 DONE +badger 2025/06/12 03:34:05 INFO: Force compaction on level 0 done +--- PASS: Test_QueueBind_Success_Rebind (0.10s) === RUN Test_QueueBind_Failed_ExchangeNotExists -badger 2024/05/09 21:05:28 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:28 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:28 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:28 INFO: Storing value log head: {Fid:0 Len:29 Offset:293} -badger 2024/05/09 21:05:28 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 -badger 2024/05/09 21:05:28 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 22.460542ms -badger 2024/05/09 21:05:28 INFO: [Compactor: 173] Compaction for level: 0 DONE -badger 2024/05/09 21:05:28 INFO: Force compaction on level 0 done ---- PASS: Test_QueueBind_Failed_ExchangeNotExists (0.28s) +badger 2025/06/12 03:34:05 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:34:05 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:34:05 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:34:05 INFO: Storing value log head: {Fid:0 Len:29 Offset:293} +badger 2025/06/12 03:34:05 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 +badger 2025/06/12 03:34:05 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 6.15094ms +badger 2025/06/12 03:34:05 INFO: [Compactor: 173] Compaction for level: 0 DONE +badger 2025/06/12 03:34:05 INFO: Force compaction on level 0 done +--- PASS: Test_QueueBind_Failed_ExchangeNotExists (0.09s) === RUN Test_QueueBind_Failed_QueueNotExists -badger 2024/05/09 21:05:28 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:28 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:29 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:29 INFO: Storing value log head: {Fid:0 Len:29 Offset:284} -badger 2024/05/09 21:05:29 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 -badger 2024/05/09 21:05:29 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 30.624713ms -badger 2024/05/09 21:05:29 INFO: [Compactor: 173] Compaction for level: 0 DONE -badger 2024/05/09 21:05:29 INFO: Force compaction on level 0 done ---- PASS: Test_QueueBind_Failed_QueueNotExists (0.26s) +badger 2025/06/12 03:34:05 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:34:05 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:34:05 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:34:05 INFO: Storing value log head: {Fid:0 Len:29 Offset:284} +badger 2025/06/12 03:34:05 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 +badger 2025/06/12 03:34:05 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 4.248549ms +badger 2025/06/12 03:34:05 INFO: [Compactor: 173] Compaction for level: 0 DONE +badger 2025/06/12 03:34:05 INFO: Force compaction on level 0 done +--- PASS: Test_QueueBind_Failed_QueueNotExists (0.08s) === RUN Test_QueueBind_Failed_OnExclusiveQueue -badger 2024/05/09 21:05:29 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:29 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:29 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:29 INFO: Storing value log head: {Fid:0 Len:29 Offset:290} -badger 2024/05/09 21:05:29 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 -badger 2024/05/09 21:05:29 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 24.789397ms -badger 2024/05/09 21:05:29 INFO: [Compactor: 173] Compaction for level: 0 DONE -badger 2024/05/09 21:05:29 INFO: Force compaction on level 0 done ---- PASS: Test_QueueBind_Failed_OnExclusiveQueue (0.25s) +badger 2025/06/12 03:34:05 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:34:05 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:34:05 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:34:05 INFO: Storing value log head: {Fid:0 Len:29 Offset:290} +badger 2025/06/12 03:34:05 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 +badger 2025/06/12 03:34:05 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 7.859764ms +badger 2025/06/12 03:34:05 INFO: [Compactor: 173] Compaction for level: 0 DONE +badger 2025/06/12 03:34:05 INFO: Force compaction on level 0 done +--- PASS: Test_QueueBind_Failed_OnExclusiveQueue (0.09s) === RUN Test_QueueUnbind_Success -badger 2024/05/09 21:05:29 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:29 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:29 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:29 INFO: Storing value log head: {Fid:0 Len:29 Offset:149} -badger 2024/05/09 21:05:29 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 -badger 2024/05/09 21:05:29 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 30.006981ms -badger 2024/05/09 21:05:29 INFO: [Compactor: 173] Compaction for level: 0 DONE -badger 2024/05/09 21:05:29 INFO: Force compaction on level 0 done ---- PASS: Test_QueueUnbind_Success (0.32s) +badger 2025/06/12 03:34:05 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:34:05 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:34:05 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:34:05 INFO: Storing value log head: {Fid:0 Len:29 Offset:149} +badger 2025/06/12 03:34:05 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 +badger 2025/06/12 03:34:05 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 5.406271ms +badger 2025/06/12 03:34:05 INFO: [Compactor: 173] Compaction for level: 0 DONE +badger 2025/06/12 03:34:05 INFO: Force compaction on level 0 done +--- PASS: Test_QueueUnbind_Success (0.07s) === RUN Test_QueueUnbind_FailedExchangeNotExists -badger 2024/05/09 21:05:29 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:29 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:29 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:29 INFO: Storing value log head: {Fid:0 Len:29 Offset:52} -badger 2024/05/09 21:05:29 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 -badger 2024/05/09 21:05:29 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 33.028733ms -badger 2024/05/09 21:05:29 INFO: [Compactor: 173] Compaction for level: 0 DONE -badger 2024/05/09 21:05:29 INFO: Force compaction on level 0 done ---- PASS: Test_QueueUnbind_FailedExchangeNotExists (0.28s) +badger 2025/06/12 03:34:05 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:34:05 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:34:05 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:34:05 INFO: Storing value log head: {Fid:0 Len:29 Offset:52} +badger 2025/06/12 03:34:05 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 +badger 2025/06/12 03:34:05 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 7.440995ms +badger 2025/06/12 03:34:05 INFO: [Compactor: 173] Compaction for level: 0 DONE +badger 2025/06/12 03:34:05 INFO: Force compaction on level 0 done +--- PASS: Test_QueueUnbind_FailedExchangeNotExists (0.10s) === RUN Test_QueueUnbind_FailedQueueNotExists -badger 2024/05/09 21:05:30 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:30 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:30 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:30 INFO: Storing value log head: {Fid:0 Len:29 Offset:52} -badger 2024/05/09 21:05:30 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 -badger 2024/05/09 21:05:30 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 34.770567ms -badger 2024/05/09 21:05:30 INFO: [Compactor: 173] Compaction for level: 0 DONE -badger 2024/05/09 21:05:30 INFO: Force compaction on level 0 done ---- PASS: Test_QueueUnbind_FailedQueueNotExists (0.26s) +badger 2025/06/12 03:34:05 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:34:05 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:34:05 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:34:05 INFO: Storing value log head: {Fid:0 Len:29 Offset:52} +badger 2025/06/12 03:34:05 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 +badger 2025/06/12 03:34:05 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 6.031902ms +badger 2025/06/12 03:34:05 INFO: [Compactor: 173] Compaction for level: 0 DONE +badger 2025/06/12 03:34:05 INFO: Force compaction on level 0 done +--- PASS: Test_QueueUnbind_FailedQueueNotExists (0.09s) === RUN Test_QueueUnbind_Failed_OnExclusiveQueue -badger 2024/05/09 21:05:30 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:30 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:30 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:30 INFO: Storing value log head: {Fid:0 Len:29 Offset:296} -badger 2024/05/09 21:05:30 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 -badger 2024/05/09 21:05:30 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 289.504604ms -badger 2024/05/09 21:05:30 INFO: [Compactor: 173] Compaction for level: 0 DONE -badger 2024/05/09 21:05:30 INFO: Force compaction on level 0 done ---- PASS: Test_QueueUnbind_Failed_OnExclusiveQueue (0.94s) +badger 2025/06/12 03:34:05 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:34:05 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:34:05 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:34:05 INFO: Storing value log head: {Fid:0 Len:29 Offset:296} +badger 2025/06/12 03:34:05 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 +badger 2025/06/12 03:34:05 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 5.734287ms +badger 2025/06/12 03:34:05 INFO: [Compactor: 173] Compaction for level: 0 DONE +badger 2025/06/12 03:34:05 INFO: Force compaction on level 0 done +--- PASS: Test_QueueUnbind_Failed_OnExclusiveQueue (0.09s) === RUN Test_QueuePurge_Success -badger 2024/05/09 21:05:32 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:33 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:34 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:35 INFO: Storing value log head: {Fid:0 Len:29 Offset:52} -badger 2024/05/09 21:05:35 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 -badger 2024/05/09 21:05:35 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 24.161287ms -badger 2024/05/09 21:05:35 INFO: [Compactor: 173] Compaction for level: 0 DONE -badger 2024/05/09 21:05:35 INFO: Force compaction on level 0 done ---- PASS: Test_QueuePurge_Success (4.16s) +badger 2025/06/12 03:34:05 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:34:05 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:34:05 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:34:05 INFO: Storing value log head: {Fid:0 Len:29 Offset:52} +badger 2025/06/12 03:34:05 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 +badger 2025/06/12 03:34:05 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 5.963423ms +badger 2025/06/12 03:34:05 INFO: [Compactor: 173] Compaction for level: 0 DONE +badger 2025/06/12 03:34:05 INFO: Force compaction on level 0 done +--- PASS: Test_QueuePurge_Success (0.09s) === RUN Test_QueuePurge_Failed_QueueNotExists -badger 2024/05/09 21:05:35 INFO: All 0 tables opened in 1ms -badger 2024/05/09 21:05:35 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:35 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:35 INFO: Storing value log head: {Fid:0 Len:29 Offset:287} -badger 2024/05/09 21:05:35 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 -badger 2024/05/09 21:05:35 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 128.312631ms -badger 2024/05/09 21:05:35 INFO: [Compactor: 173] Compaction for level: 0 DONE -badger 2024/05/09 21:05:35 INFO: Force compaction on level 0 done ---- PASS: Test_QueuePurge_Failed_QueueNotExists (0.38s) +badger 2025/06/12 03:34:05 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:34:05 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:34:05 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:34:05 INFO: Storing value log head: {Fid:0 Len:29 Offset:287} +badger 2025/06/12 03:34:06 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 +badger 2025/06/12 03:34:07 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 684.124415ms +badger 2025/06/12 03:34:07 INFO: [Compactor: 173] Compaction for level: 0 DONE +badger 2025/06/12 03:34:07 INFO: Force compaction on level 0 done +--- PASS: Test_QueuePurge_Failed_QueueNotExists (1.46s) === RUN Test_QueuePurge_Failed_OnExclusiveQueue -badger 2024/05/09 21:05:35 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:35 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:35 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:35 INFO: Storing value log head: {Fid:0 Len:29 Offset:293} -badger 2024/05/09 21:05:35 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 -badger 2024/05/09 21:05:35 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 32.682726ms -badger 2024/05/09 21:05:35 INFO: [Compactor: 173] Compaction for level: 0 DONE -badger 2024/05/09 21:05:35 INFO: Force compaction on level 0 done ---- PASS: Test_QueuePurge_Failed_OnExclusiveQueue (0.24s) +badger 2025/06/12 03:34:07 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:34:07 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:34:07 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:34:07 INFO: Storing value log head: {Fid:0 Len:29 Offset:293} +badger 2025/06/12 03:34:07 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 +badger 2025/06/12 03:34:07 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 7.500473ms +badger 2025/06/12 03:34:07 INFO: [Compactor: 173] Compaction for level: 0 DONE +badger 2025/06/12 03:34:07 INFO: Force compaction on level 0 done +--- PASS: Test_QueuePurge_Failed_OnExclusiveQueue (0.10s) === RUN Test_QueueDelete_Success -badger 2024/05/09 21:05:35 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:36 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:36 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:36 INFO: Storing value log head: {Fid:0 Len:29 Offset:248} -badger 2024/05/09 21:05:36 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 -badger 2024/05/09 21:05:36 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 22.871856ms -badger 2024/05/09 21:05:36 INFO: [Compactor: 173] Compaction for level: 0 DONE -badger 2024/05/09 21:05:36 INFO: Force compaction on level 0 done ---- PASS: Test_QueueDelete_Success (0.25s) +badger 2025/06/12 03:34:07 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:34:07 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:34:07 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:34:07 INFO: Storing value log head: {Fid:0 Len:29 Offset:248} +badger 2025/06/12 03:34:07 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 +badger 2025/06/12 03:34:07 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 7.070293ms +badger 2025/06/12 03:34:07 INFO: [Compactor: 173] Compaction for level: 0 DONE +badger 2025/06/12 03:34:07 INFO: Force compaction on level 0 done +--- PASS: Test_QueueDelete_Success (0.10s) === RUN Test_QueueDeleteDurable_Success -badger 2024/05/09 21:05:36 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:36 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:36 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:36 INFO: Storing value log head: {Fid:0 Len:29 Offset:393} -badger 2024/05/09 21:05:36 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 -badger 2024/05/09 21:05:36 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 22.0355ms -badger 2024/05/09 21:05:36 INFO: [Compactor: 173] Compaction for level: 0 DONE -badger 2024/05/09 21:05:36 INFO: Force compaction on level 0 done ---- PASS: Test_QueueDeleteDurable_Success (0.27s) +badger 2025/06/12 03:34:07 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:34:07 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:34:07 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:34:07 INFO: Storing value log head: {Fid:0 Len:29 Offset:393} +badger 2025/06/12 03:34:07 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 +badger 2025/06/12 03:34:07 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 7.048545ms +badger 2025/06/12 03:34:07 INFO: [Compactor: 173] Compaction for level: 0 DONE +badger 2025/06/12 03:34:07 INFO: Force compaction on level 0 done +--- PASS: Test_QueueDeleteDurable_Success (0.09s) === RUN Test_QueueDelete_Failed_NotEmpty -badger 2024/05/09 21:05:36 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:36 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:36 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:36 INFO: Storing value log head: {Fid:0 Len:29 Offset:52} -badger 2024/05/09 21:05:36 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 -badger 2024/05/09 21:05:36 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 24.069024ms -badger 2024/05/09 21:05:36 INFO: [Compactor: 173] Compaction for level: 0 DONE -badger 2024/05/09 21:05:36 INFO: Force compaction on level 0 done ---- PASS: Test_QueueDelete_Failed_NotEmpty (0.27s) +badger 2025/06/12 03:34:07 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:34:07 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:34:07 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:34:07 INFO: Storing value log head: {Fid:0 Len:29 Offset:52} +badger 2025/06/12 03:34:07 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 +badger 2025/06/12 03:34:07 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 7.583484ms +badger 2025/06/12 03:34:07 INFO: [Compactor: 173] Compaction for level: 0 DONE +badger 2025/06/12 03:34:07 INFO: Force compaction on level 0 done +--- PASS: Test_QueueDelete_Failed_NotEmpty (0.10s) === RUN Test_QueueDelete_Failed_QueueNotExists -badger 2024/05/09 21:05:36 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:36 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:36 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:36 INFO: Storing value log head: {Fid:0 Len:29 Offset:290} -badger 2024/05/09 21:05:37 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 -badger 2024/05/09 21:05:37 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 26.164733ms -badger 2024/05/09 21:05:37 INFO: [Compactor: 173] Compaction for level: 0 DONE -badger 2024/05/09 21:05:37 INFO: Force compaction on level 0 done ---- PASS: Test_QueueDelete_Failed_QueueNotExists (0.29s) +badger 2025/06/12 03:34:07 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:34:07 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:34:07 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:34:07 INFO: Storing value log head: {Fid:0 Len:29 Offset:290} +badger 2025/06/12 03:34:07 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 +badger 2025/06/12 03:34:07 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 6.403487ms +badger 2025/06/12 03:34:07 INFO: [Compactor: 173] Compaction for level: 0 DONE +badger 2025/06/12 03:34:07 INFO: Force compaction on level 0 done +--- PASS: Test_QueueDelete_Failed_QueueNotExists (0.10s) === RUN Test_QueueDelete_Failed_OnExclusiveQueue -badger 2024/05/09 21:05:37 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:37 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:37 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:37 INFO: Storing value log head: {Fid:0 Len:29 Offset:296} -badger 2024/05/09 21:05:37 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 -badger 2024/05/09 21:05:37 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 23.08166ms -badger 2024/05/09 21:05:37 INFO: [Compactor: 173] Compaction for level: 0 DONE -badger 2024/05/09 21:05:37 INFO: Force compaction on level 0 done ---- PASS: Test_QueueDelete_Failed_OnExclusiveQueue (0.28s) +badger 2025/06/12 03:34:07 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:34:07 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:34:07 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:34:07 INFO: Storing value log head: {Fid:0 Len:29 Offset:296} +badger 2025/06/12 03:34:07 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 +badger 2025/06/12 03:34:07 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 10.19309ms +badger 2025/06/12 03:34:07 INFO: [Compactor: 173] Compaction for level: 0 DONE +badger 2025/06/12 03:34:07 INFO: Force compaction on level 0 done +--- PASS: Test_QueueDelete_Failed_OnExclusiveQueue (0.09s) === RUN Test_Basic_AutoDelete -badger 2024/05/09 21:05:37 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:37 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:37 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:38 INFO: Storing value log head: {Fid:0 Len:29 Offset:239} -badger 2024/05/09 21:05:38 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 -badger 2024/05/09 21:05:38 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 32.060037ms -badger 2024/05/09 21:05:38 INFO: [Compactor: 173] Compaction for level: 0 DONE -badger 2024/05/09 21:05:38 INFO: Force compaction on level 0 done ---- PASS: Test_Basic_AutoDelete (1.37s) +badger 2025/06/12 03:34:07 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:34:07 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:34:07 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:34:08 INFO: Storing value log head: {Fid:0 Len:29 Offset:239} +badger 2025/06/12 03:34:08 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 +badger 2025/06/12 03:34:08 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 5.918096ms +badger 2025/06/12 03:34:08 INFO: [Compactor: 173] Compaction for level: 0 DONE +badger 2025/06/12 03:34:08 INFO: Force compaction on level 0 done +--- PASS: Test_Basic_AutoDelete (1.13s) === RUN TestServer_GetConnections -badger 2024/05/09 21:05:38 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:38 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:38 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:38 INFO: Storing value log head: {Fid:0 Len:29 Offset:52} -badger 2024/05/09 21:05:38 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 -badger 2024/05/09 21:05:38 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 37.123973ms -badger 2024/05/09 21:05:38 INFO: [Compactor: 173] Compaction for level: 0 DONE -badger 2024/05/09 21:05:38 INFO: Force compaction on level 0 done ---- PASS: TestServer_GetConnections (0.33s) +badger 2025/06/12 03:34:08 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:34:08 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:34:08 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:34:08 INFO: Storing value log head: {Fid:0 Len:29 Offset:52} +badger 2025/06/12 03:34:08 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 +badger 2025/06/12 03:34:08 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 4.829918ms +badger 2025/06/12 03:34:08 INFO: [Compactor: 173] Compaction for level: 0 DONE +badger 2025/06/12 03:34:08 INFO: Force compaction on level 0 done +--- PASS: TestServer_GetConnections (0.09s) === RUN TestServer_GetProtoVersion -badger 2024/05/09 21:05:39 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:39 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:39 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:39 INFO: Storing value log head: {Fid:0 Len:29 Offset:52} -badger 2024/05/09 21:05:39 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 -badger 2024/05/09 21:05:39 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 24.211979ms -badger 2024/05/09 21:05:39 INFO: [Compactor: 173] Compaction for level: 0 DONE -badger 2024/05/09 21:05:39 INFO: Force compaction on level 0 done ---- PASS: TestServer_GetProtoVersion (0.27s) +badger 2025/06/12 03:34:08 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:34:09 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:34:09 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:34:09 INFO: Storing value log head: {Fid:0 Len:29 Offset:52} +badger 2025/06/12 03:34:09 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 +badger 2025/06/12 03:34:09 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 8.160491ms +badger 2025/06/12 03:34:09 INFO: [Compactor: 173] Compaction for level: 0 DONE +badger 2025/06/12 03:34:09 INFO: Force compaction on level 0 done +--- PASS: TestServer_GetProtoVersion (0.09s) === RUN TestServer_GetVhosts -badger 2024/05/09 21:05:39 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:39 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:39 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:39 INFO: Storing value log head: {Fid:0 Len:29 Offset:52} -badger 2024/05/09 21:05:39 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 -badger 2024/05/09 21:05:39 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 26.471786ms -badger 2024/05/09 21:05:39 INFO: [Compactor: 173] Compaction for level: 0 DONE -badger 2024/05/09 21:05:39 INFO: Force compaction on level 0 done ---- PASS: TestServer_GetVhosts (0.31s) +badger 2025/06/12 03:34:09 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:34:09 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:34:09 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:34:09 INFO: Storing value log head: {Fid:0 Len:29 Offset:52} +badger 2025/06/12 03:34:09 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 +badger 2025/06/12 03:34:09 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 4.829532ms +badger 2025/06/12 03:34:09 INFO: [Compactor: 173] Compaction for level: 0 DONE +badger 2025/06/12 03:34:09 INFO: Force compaction on level 0 done +--- PASS: TestServer_GetVhosts (0.09s) === RUN TestServer_RealStart -badger 2024/05/09 21:05:39 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:39 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:39 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:41 INFO: Storing value log head: {Fid:0 Len:29 Offset:119} -badger 2024/05/09 21:05:41 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 -badger 2024/05/09 21:05:41 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 20.32763ms -badger 2024/05/09 21:05:41 INFO: [Compactor: 173] Compaction for level: 0 DONE -badger 2024/05/09 21:05:41 INFO: Force compaction on level 0 done ---- PASS: TestServer_RealStart (2.07s) +badger 2025/06/12 03:34:09 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:34:09 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:34:09 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:34:11 INFO: Storing value log head: {Fid:0 Len:29 Offset:119} +badger 2025/06/12 03:34:11 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 +badger 2025/06/12 03:34:11 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 7.164706ms +badger 2025/06/12 03:34:11 INFO: [Compactor: 173] Compaction for level: 0 DONE +badger 2025/06/12 03:34:11 INFO: Force compaction on level 0 done +--- PASS: TestServer_RealStart (2.08s) === RUN TestServer_WrongProtocol -badger 2024/05/09 21:05:41 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:41 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:41 INFO: All 0 tables opened in 0s -badger 2024/05/09 21:05:43 INFO: Storing value log head: {Fid:0 Len:29 Offset:119} -badger 2024/05/09 21:05:43 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 -badger 2024/05/09 21:05:43 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 22.737371ms -badger 2024/05/09 21:05:43 INFO: [Compactor: 173] Compaction for level: 0 DONE -badger 2024/05/09 21:05:43 INFO: Force compaction on level 0 done ---- PASS: TestServer_WrongProtocol (2.09s) +badger 2025/06/12 03:34:11 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:34:11 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:34:11 INFO: All 0 tables opened in 0s +badger 2025/06/12 03:34:13 INFO: Storing value log head: {Fid:0 Len:29 Offset:119} +badger 2025/06/12 03:34:13 INFO: [Compactor: 173] Running compaction: {level:0 score:1.73 dropPrefixes:[]} for level: 0 +badger 2025/06/12 03:34:13 INFO: LOG Compact 0->1, del 1 tables, add 1 tables, took 5.194403ms +badger 2025/06/12 03:34:13 INFO: [Compactor: 173] Compaction for level: 0 DONE +badger 2025/06/12 03:34:13 INFO: Force compaction on level 0 done +--- PASS: TestServer_WrongProtocol (2.03s) PASS -ok github.com/valinurovam/garagemq/server 69.613s +ok github.com/valinurovam/garagemq/server 39.564s make[1]: Leaving directory '/build/reproducible-path/garagemq-0.0~git20200204.15e6a9d+ds' create-stamp debian/debhelper-build-stamp fakeroot debian/rules binary @@ -2187,12 +2223,14 @@ dpkg-buildpackage: info: binary-only upload (no source included) dpkg-genchanges: info: not including original source code in upload I: copying local configuration +I: user script /srv/workspace/pbuilder/3281343/tmp/hooks/B01_cleanup starting +I: user script /srv/workspace/pbuilder/3281343/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/2456589 and its subdirectories -I: Current time: Thu May 9 09:06:03 -12 2024 -I: pbuilder-time-stamp: 1715288763 +I: removing directory /srv/workspace/pbuilder/3281343 and its subdirectories +I: Current time: Thu Jun 12 17:34:25 +14 2025 +I: pbuilder-time-stamp: 1749699265