Diff of the two buildlogs: -- --- b1/build.log 2025-10-12 09:28:46.875315816 +0000 +++ b2/build.log 2025-10-12 09:34:37.423750145 +0000 @@ -1,6 +1,6 @@ I: pbuilder: network access will be disabled during build -I: Current time: Sat Nov 14 03:49:32 -12 2026 -I: pbuilder-time-stamp: 1794671372 +I: Current time: Sun Oct 12 23:28:49 +14 2025 +I: pbuilder-time-stamp: 1760261329 I: Building the build Environment I: extracting base tarball [/var/cache/pbuilder/forky-reproducible-base.tgz] I: copying local configuration @@ -24,53 +24,85 @@ dpkg-source: info: applying concurrent-web-server-connection-refused.patch I: Not using root during the build. I: Installing the build-deps -I: user script /srv/workspace/pbuilder/3523896/tmp/hooks/D02_print_environment starting +I: user script /srv/workspace/pbuilder/3950443/tmp/hooks/D01_modify_environment starting +debug: Running on ionos1-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 Oct 12 09: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/3950443/tmp/hooks/D01_modify_environment finished +I: user script /srv/workspace/pbuilder/3950443/tmp/hooks/D02_print_environment starting I: set - BUILDDIR='/build/reproducible-path' - BUILDUSERGECOS='first user,first room,first work-phone,first home-phone,first other' - BUILDUSERNAME='pbuilder1' - BUILD_ARCH='amd64' - DEBIAN_FRONTEND='noninteractive' - DEB_BUILD_OPTIONS='buildinfo=+all reproducible=+all parallel=42 ' - DISTRIBUTION='forky' - 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]="3" [2]="3" [3]="1" [4]="release" [5]="x86_64-pc-linux-gnu") + BASH_VERSION='5.3.3(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=40 ' + DIRSTACK=() + DISTRIBUTION=forky + EUID=0 + FUNCNAME=([0]="Echo" [1]="main") + GROUPS=() + HOME=/root + HOSTNAME=i-capture-the-hostname + HOSTTYPE=x86_64 + HOST_ARCH=amd64 IFS=' ' - INVOCATION_ID='f33c794d853f43d295c2f21957d09986' - 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='3523896' - PS1='# ' - PS2='> ' + INVOCATION_ID=1d2dffe9f23d45b3b39c484dc1fff551 + 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=3950443 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.msALRjgn/pbuilderrc_Psl2 --distribution forky --hookdir /etc/pbuilder/first-build-hooks --debbuildopts -b --basetgz /var/cache/pbuilder/forky-reproducible-base.tgz --buildresult /srv/reproducible-results/rbuild-debian/r-b-build.msALRjgn/b1 --logfile b1/build.log guile-fibers_1.4.1-2.dsc' - SUDO_GID='111' - SUDO_HOME='/var/lib/jenkins' - SUDO_UID='106' - SUDO_USER='jenkins' - TERM='unknown' - TZ='/usr/share/zoneinfo/Etc/GMT+12' - USER='root' - _='/usr/bin/systemd-run' - http_proxy='http://213.165.73.152:3128' + PWD=/ + SHELL=/bin/bash + SHELLOPTS=braceexpand:errexit:hashall:interactive-comments:posix + SHLVL=3 + SUDO_COMMAND='/usr/bin/timeout -k 24.1h 24h /usr/bin/ionice -c 3 /usr/bin/nice -n 11 /usr/bin/unshare --uts -- /usr/sbin/pbuilder --build --configfile /srv/reproducible-results/rbuild-debian/r-b-build.msALRjgn/pbuilderrc_MGlw --distribution forky --hookdir /etc/pbuilder/rebuild-hooks --debbuildopts -b --basetgz /var/cache/pbuilder/forky-reproducible-base.tgz --buildresult /srv/reproducible-results/rbuild-debian/r-b-build.msALRjgn/b2 --logfile b2/build.log guile-fibers_1.4.1-2.dsc' + SUDO_GID=110 + SUDO_HOME=/var/lib/jenkins + SUDO_UID=105 + SUDO_USER=jenkins + TERM=unknown + TZ=/usr/share/zoneinfo/Etc/GMT-14 + UID=0 + USER=root + _='I: set' + http_proxy=http://46.16.76.132:3128 I: uname -a - Linux ionos15-amd64 6.12.48+deb13-amd64 #1 SMP PREEMPT_DYNAMIC Debian 6.12.48-1 (2025-09-20) x86_64 GNU/Linux + Linux i-capture-the-hostname 6.12.48+deb13-amd64 #1 SMP PREEMPT_DYNAMIC Debian 6.12.48-1 (2025-09-20) x86_64 GNU/Linux I: ls -l /bin - lrwxrwxrwx 1 root root 7 Aug 10 2025 /bin -> usr/bin -I: user script /srv/workspace/pbuilder/3523896/tmp/hooks/D02_print_environment finished + lrwxrwxrwx 1 root root 7 Aug 10 12:30 /bin -> usr/bin +I: user script /srv/workspace/pbuilder/3950443/tmp/hooks/D02_print_environment finished -> Attempting to satisfy build-dependencies -> Creating pbuilder-satisfydepends-dummy package Package: pbuilder-satisfydepends-dummy @@ -171,7 +203,7 @@ Get: 59 http://deb.debian.org/debian forky/main amd64 tex-common all 6.19 [29.4 kB] Get: 60 http://deb.debian.org/debian forky/main amd64 texinfo-lib amd64 7.2-4 [807 kB] Get: 61 http://deb.debian.org/debian forky/main amd64 texinfo all 7.2-4 [1974 kB] -Fetched 27.1 MB in 0s (99.9 MB/s) +Fetched 27.1 MB in 1s (37.9 MB/s) Preconfiguring packages ... Selecting previously unselected package libproc2-0:amd64. (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 ... 19898 files and directories currently installed.) @@ -446,7 +478,11 @@ Building tag database... -> Finished parsing the build-deps I: Building the package -I: Running cd /build/reproducible-path/guile-fibers-1.4.1/ && 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 > ../guile-fibers_1.4.1-2_source.changes +I: user script /srv/workspace/pbuilder/3950443/tmp/hooks/A99_set_merged_usr starting +Not re-configuring usrmerge for forky +I: user script /srv/workspace/pbuilder/3950443/tmp/hooks/A99_set_merged_usr finished +hostname: Name or service not known +I: Running cd /build/reproducible-path/guile-fibers-1.4.1/ && 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 > ../guile-fibers_1.4.1-2_source.changes dpkg-buildpackage: info: source package guile-fibers dpkg-buildpackage: info: source version 1.4.1-2 dpkg-buildpackage: info: source distribution unstable @@ -586,7 +622,7 @@ config.status: executing depfiles commands config.status: executing libtool commands dh_auto_build -O--builddirectory=. - make -j42 + make -j40 make[1]: Entering directory '/build/reproducible-path/guile-fibers-1.4.1' /usr/bin/mkdir -p fibers mkdir -p /build/reproducible-path/guile-fibers-1.4.1/override/fibers @@ -594,21 +630,21 @@ /usr/bin/sed -e 's|[@]extlibdir[@]|/usr/lib/x86_64-linux-gnu/guile/3.0/extensions|' \ -e 's|[@]PACKAGE_VERSION[@]|1.4.1|' \ "./fibers/config.scm.in" > fibers/config.scm.tmp -cp -f /build/reproducible-path/guile-fibers-1.4.1/fibers/posix-clocks-generic.scm /build/reproducible-path/guile-fibers-1.4.1/override/fibers/posix-clocks.scm cp -f /build/reproducible-path/guile-fibers-1.4.1/fibers/epoll.scm /build/reproducible-path/guile-fibers-1.4.1/override/fibers/events-impl.scm +cp -f /build/reproducible-path/guile-fibers-1.4.1/fibers/posix-clocks-generic.scm /build/reproducible-path/guile-fibers-1.4.1/override/fibers/posix-clocks.scm mv fibers/config.scm.tmp fibers/config.scm make all-am make[2]: Entering directory '/build/reproducible-path/guile-fibers-1.4.1' restore=: && backupdir=".am$$" && \ am__cwd=`pwd` && CDPATH="${ZSH_VERSION+.}:" && cd . && \ rm -rf $backupdir && mkdir $backupdir && \ -if (/bin/bash '/build/reproducible-path/guile-fibers-1.4.1/build-aux/missing' makeinfo --version) >/dev/null 2>&1; then \ +if (/bin/sh '/build/reproducible-path/guile-fibers-1.4.1/build-aux/missing' makeinfo --version) >/dev/null 2>&1; then \ for f in fibers.info fibers.info-[0-9] fibers.info-[0-9][0-9] fibers.i[0-9] fibers.i[0-9][0-9]; do \ if test -f $f; then mv $f $backupdir; restore=mv; else :; fi; \ done; \ else :; fi && \ cd "$am__cwd"; \ -if /bin/bash '/build/reproducible-path/guile-fibers-1.4.1/build-aux/missing' makeinfo -I . \ +if /bin/sh '/build/reproducible-path/guile-fibers-1.4.1/build-aux/missing' makeinfo -I . \ -o fibers.info fibers.texi; \ then \ rc=0; \ @@ -625,14 +661,31 @@ GUILE_AUTO_COMPILE=0 \ /usr/bin/guild-3.0 compile -L "/build/reproducible-path/guile-fibers-1.4.1" \ -Wunbound-variable -Warity-mismatch -Wformat -o "override/fibers/posix-clocks.go" "override/fibers/posix-clocks.scm" -/bin/bash ./libtool --tag=CC --mode=compile gcc -DHAVE_CONFIG_H -I. -Wdate-time -D_FORTIFY_SOURCE=2 -I. -Wall -Werror -I/usr/include/guile/3.0 -I./extensions -g -O2 -Werror=implicit-function-declaration -ffile-prefix-map=/build/reproducible-path/guile-fibers-1.4.1=. -fstack-protector-strong -fstack-clash-protection -Wformat -Werror=format-security -fcf-protection -c -o extensions/fibers_epoll_la-epoll.lo `test -f 'extensions/epoll.c' || echo './'`extensions/epoll.c +/bin/sh ./libtool --tag=CC --mode=compile gcc -DHAVE_CONFIG_H -I. -Wdate-time -D_FORTIFY_SOURCE=2 -I. -Wall -Werror -I/usr/include/guile/3.0 -I./extensions -g -O2 -Werror=implicit-function-declaration -ffile-prefix-map=/build/reproducible-path/guile-fibers-1.4.1=. -fstack-protector-strong -fstack-clash-protection -Wformat -Werror=format-security -fcf-protection -c -o extensions/fibers_epoll_la-epoll.lo `test -f 'extensions/epoll.c' || echo './'`extensions/epoll.c libtool: compile: gcc -DHAVE_CONFIG_H -I. -Wdate-time -D_FORTIFY_SOURCE=2 -I. -Wall -Werror -I/usr/include/guile/3.0 -I./extensions -g -O2 -Werror=implicit-function-declaration -ffile-prefix-map=/build/reproducible-path/guile-fibers-1.4.1=. -fstack-protector-strong -fstack-clash-protection -Wformat -Werror=format-security -fcf-protection -c extensions/epoll.c -fPIC -DPIC -o extensions/.libs/fibers_epoll_la-epoll.o -/bin/bash ./libtool --tag=CC --mode=link gcc -I. -Wall -Werror -I/usr/include/guile/3.0 -I./extensions -g -O2 -Werror=implicit-function-declaration -ffile-prefix-map=/build/reproducible-path/guile-fibers-1.4.1=. -fstack-protector-strong -fstack-clash-protection -Wformat -Werror=format-security -fcf-protection -export-dynamic -module -Wl,-z,relro -Wl,-z,now -o fibers-epoll.la -rpath /usr/lib/x86_64-linux-gnu/guile/3.0/extensions extensions/fibers_epoll_la-epoll.lo -lguile-3.0 -lgc -lpthread -ldl wrote `override/fibers/posix-clocks.go' +/bin/sh ./libtool --tag=CC --mode=link gcc -I. -Wall -Werror -I/usr/include/guile/3.0 -I./extensions -g -O2 -Werror=implicit-function-declaration -ffile-prefix-map=/build/reproducible-path/guile-fibers-1.4.1=. -fstack-protector-strong -fstack-clash-protection -Wformat -Werror=format-security -fcf-protection -export-dynamic -module -Wl,-z,relro -Wl,-z,now -o fibers-epoll.la -rpath /usr/lib/x86_64-linux-gnu/guile/3.0/extensions extensions/fibers_epoll_la-epoll.lo -lguile-3.0 -lgc -lpthread -ldl libtool: link: gcc -shared -fPIC -DPIC extensions/.libs/fibers_epoll_la-epoll.o -lguile-3.0 -lgc -lpthread -ldl -Werror -g -O2 -Werror=implicit-function-declaration -ffile-prefix-map=/build/reproducible-path/guile-fibers-1.4.1=. -fstack-protector-strong -Werror=format-security -Wl,-z -Wl,relro -Wl,-z -Wl,now -Wl,-soname -Wl,fibers-epoll.so.0 -o .libs/fibers-epoll.so.0.0.0 libtool: link: (cd ".libs" && rm -f "fibers-epoll.so.0" && ln -s "fibers-epoll.so.0.0.0" "fibers-epoll.so.0") libtool: link: (cd ".libs" && rm -f "fibers-epoll.so" && ln -s "fibers-epoll.so.0.0.0" "fibers-epoll.so") libtool: link: ( cd ".libs" && rm -f "fibers-epoll.la" && ln -s "../fibers-epoll.la" "fibers-epoll.la" ) +wrote `override/fibers/events-impl.go' +override/fibers/events-impl.scm:49:15: warning: possibly unbound variable `pipe2' +override/fibers/events-impl.scm:91:33: warning: possibly unbound variable `primitive-epoll-create' +override/fibers/events-impl.scm:94:45: warning: possibly unbound variable `EPOLLIN' +override/fibers/events-impl.scm:110:3: warning: possibly unbound variable `primitive-epoll-ctl' +override/fibers/events-impl.scm:110:40: warning: possibly unbound variable `EPOLL_CTL_ADD' +override/fibers/events-impl.scm:113:40: warning: possibly unbound variable `EPOLL_CTL_MOD' +override/fibers/events-impl.scm:122:40: warning: possibly unbound variable `EPOLL_CTL_DEL' +override/fibers/events-impl.scm:133:6: warning: possibly unbound variable `primitive-epoll-wake' +override/fibers/events-impl.scm:70:14: warning: possibly unbound variable `%sizeof-struct-epoll-event' +override/fibers/events-impl.scm:174:15: warning: possibly unbound variable `primitive-epoll-wait' +override/fibers/events-impl.scm:77:12: warning: possibly unbound variable `%offsetof-struct-epoll-event-fd' +override/fibers/events-impl.scm:190:41: warning: possibly unbound variable `EPOLLRDHUP' +override/fibers/events-impl.scm:191:26: warning: possibly unbound variable `EPOLLOUT' +override/fibers/events-impl.scm:192:44: warning: possibly unbound variable `EPOLLHUP' +override/fibers/events-impl.scm:192:53: warning: possibly unbound variable `EPOLLERR' +override/fibers/events-impl.scm:202:38: warning: possibly unbound variable `EPOLLONESHOT' GUILE_AUTO_COMPILE=0 \ /usr/bin/guild-3.0 compile -L "/build/reproducible-path/guile-fibers-1.4.1" \ -Wunbound-variable -Warity-mismatch -Wformat -o "fibers.go" "fibers.scm" @@ -694,44 +747,27 @@ wrote `fibers/config.go' wrote `fibers/counter.go' wrote `fibers/interrupts.go' -override/fibers/events-impl.scm:49:15: warning: possibly unbound variable `pipe2' -override/fibers/events-impl.scm:91:33: warning: possibly unbound variable `primitive-epoll-create' -override/fibers/events-impl.scm:94:45: warning: possibly unbound variable `EPOLLIN' -override/fibers/events-impl.scm:110:3: warning: possibly unbound variable `primitive-epoll-ctl' -override/fibers/events-impl.scm:110:40: warning: possibly unbound variable `EPOLL_CTL_ADD' -override/fibers/events-impl.scm:113:40: warning: possibly unbound variable `EPOLL_CTL_MOD' -override/fibers/events-impl.scm:122:40: warning: possibly unbound variable `EPOLL_CTL_DEL' -override/fibers/events-impl.scm:133:6: warning: possibly unbound variable `primitive-epoll-wake' -override/fibers/events-impl.scm:70:14: warning: possibly unbound variable `%sizeof-struct-epoll-event' -override/fibers/events-impl.scm:174:15: warning: possibly unbound variable `primitive-epoll-wait' -override/fibers/events-impl.scm:77:12: warning: possibly unbound variable `%offsetof-struct-epoll-event-fd' -override/fibers/events-impl.scm:190:41: warning: possibly unbound variable `EPOLLRDHUP' -override/fibers/events-impl.scm:191:26: warning: possibly unbound variable `EPOLLOUT' -override/fibers/events-impl.scm:192:44: warning: possibly unbound variable `EPOLLHUP' -override/fibers/events-impl.scm:192:53: warning: possibly unbound variable `EPOLLERR' -override/fibers/events-impl.scm:202:38: warning: possibly unbound variable `EPOLLONESHOT' -wrote `override/fibers/events-impl.go' -wrote `fibers/timers.go' -wrote `fibers/deque.go' wrote `fibers/nameset.go' wrote `fibers/stack.go' -wrote `fibers.go' -wrote `fibers/io-wakeup.go' +wrote `fibers/deque.go' +wrote `fibers/timers.go' +wrote `fibers/channels.go' wrote `fibers/conditions.go' -wrote `fibers/web/server.go' wrote `web/server/fibers.go' -wrote `fibers/channels.go' +wrote `fibers/web/server.go' +wrote `fibers/io-wakeup.go' wrote `fibers/repl.go' +wrote `fibers.go' wrote `fibers/psq.go' wrote `fibers/operations.go' -wrote `fibers/scheduler.go' wrote `fibers/timer-wheel.go' +wrote `fibers/scheduler.go' make[2]: Leaving directory '/build/reproducible-path/guile-fibers-1.4.1' make[1]: Leaving directory '/build/reproducible-path/guile-fibers-1.4.1' debian/rules override_dh_auto_test make[1]: Entering directory '/build/reproducible-path/guile-fibers-1.4.1' timeout --kill-after=1m 15m dh_auto_test - make -j42 check TESTSUITEFLAGS="-j42 --verbose" VERBOSE=1 + make -j40 check TESTSUITEFLAGS="-j40 --verbose" VERBOSE=1 make[2]: Entering directory '/build/reproducible-path/guile-fibers-1.4.1' make check-am make[3]: Entering directory '/build/reproducible-path/guile-fibers-1.4.1' @@ -739,87 +775,87 @@ make[4]: Entering directory '/build/reproducible-path/guile-fibers-1.4.1' scheduler objects can be printed with a reasonable length: assert (<= (string-length (pk (call-with-output-string (lambda (port) (display (make-scheduler #:parallelism 4) port))))) (+ (string-length "#") (* 4 2 (sizeof (quote *))))) equal to #t: -;;; ("#") +;;; ("#") ok assert #f equal to #f: ok assert #t terminates: ok assert (false-if-exception (begin (run-fibers) #t)) equal to #f: ok -assert (let ((before (thread-count))) (run-fibers (lambda () #t)) (= before (thread-count))) equal to #t: ok +assert (let ((before (thread-count))) (run-fibers (lambda () #t)) (= before (thread-count))) equal to #t: no (got #f) WARNING: (tests basic): imported module (fibers) overrides core binding `sleep' -assert terminates: (run-fibers (lambda () (sleep 1)) #:drain? #t): ok (1.043856178 s) -thread count: 2 vs 2 -assert terminates: (run-fibers (lambda () (do-times 1 (spawn-fiber (lambda () #t)))) #:drain? #t): ok (0.024460213 s) -thread count: 2 vs 2 -assert terminates: (run-fibers (lambda () (do-times 10 (spawn-fiber (lambda () #t)))) #:drain? #t): ok (0.03439216 s) -thread count: 2 vs 2 -assert terminates: (run-fibers (lambda () (do-times 100 (spawn-fiber (lambda () #t)))) #:drain? #t): ok (0.028384444 s) -thread count: 2 vs 2 -assert terminates: (run-fibers (lambda () (do-times 1000 (spawn-fiber (lambda () #t)))) #:drain? #t): ok (0.031760325 s) +assert terminates: (run-fibers (lambda () (sleep 1)) #:drain? #t): ok (1.206439964 s) +thread count: 3 vs 2 +assert terminates: (run-fibers (lambda () (do-times 1 (spawn-fiber (lambda () #t)))) #:drain? #t): ok (0.187065424 s) thread count: 2 vs 2 -assert terminates: (run-fibers (lambda () (do-times 10000 (spawn-fiber (lambda () #t)))) #:drain? #t): ok (0.04440091 s) +assert terminates: (run-fibers (lambda () (do-times 10 (spawn-fiber (lambda () #t)))) #:drain? #t): ok (0.142843779 s) thread count: 2 vs 2 -assert terminates: (run-fibers (lambda () (do-times 100000 (spawn-fiber (lambda () #t)))) #:drain? #t): ok (0.272051157 s) +assert terminates: (run-fibers (lambda () (do-times 100 (spawn-fiber (lambda () #t)))) #:drain? #t): ok (0.150636694 s) thread count: 2 vs 2 -assert terminates: (run-fibers (lambda () (do-times 100000 (spawn-fiber (lambda () #t) #:parallel? #t))) #:drain? #t): ok (0.691550965 s) +assert terminates: (run-fibers (lambda () (do-times 1000 (spawn-fiber (lambda () #t)))) #:drain? #t): ok (0.09676584 s) +thread count: 2 vs 3 +assert terminates: (run-fibers (lambda () (do-times 10000 (spawn-fiber (lambda () #t)))) #:drain? #t): ok (0.545884692 s) +thread count: 3 vs 2 +assert terminates: (run-fibers (lambda () (do-times 100000 (spawn-fiber (lambda () #t)))) #:drain? #t): ok (0.643553255 s) thread count: 2 vs 2 -assert terminates: (run-fibers (lambda () (do-times 100000 (spawn-fiber loop-long-enough))) #:drain? #t): ok (6.317290933 s) +assert terminates: (run-fibers (lambda () (do-times 100000 (spawn-fiber (lambda () #t) #:parallel? #t))) #:drain? #t): ok (1.424953235 s) thread count: 2 vs 2 -assert terminates: (run-fibers (lambda () (do-times 100000 (spawn-fiber loop-long-enough #:parallel? #t))) #:drain? #t): ok (4.187827764 s) +assert terminates: (run-fibers (lambda () (do-times 100000 (spawn-fiber loop-long-enough))) #:drain? #t): ok (15.715840051 s) thread count: 2 vs 2 -assert terminates: (run-fibers (lambda () (do-times 1 (spawn-fiber (lambda () (sleep 1))))) #:drain? #t): ok (1.036078135 s) +assert terminates: (run-fibers (lambda () (do-times 100000 (spawn-fiber loop-long-enough #:parallel? #t))) #:drain? #t): ok (13.181571134 s) thread count: 2 vs 2 -assert terminates: (run-fibers (lambda () (do-times 10 (spawn-fiber (lambda () (sleep 1))))) #:drain? #t): ok (1.047169589 s) +assert terminates: (run-fibers (lambda () (do-times 1 (spawn-fiber (lambda () (sleep 1))))) #:drain? #t): ok (1.122364065 s) thread count: 2 vs 2 -assert terminates: (run-fibers (lambda () (do-times 100 (spawn-fiber (lambda () (sleep 1))))) #:drain? #t): ok (1.045999568 s) +assert terminates: (run-fibers (lambda () (do-times 10 (spawn-fiber (lambda () (sleep 1))))) #:drain? #t): ok (1.188492251 s) thread count: 2 vs 2 -assert terminates: (run-fibers (lambda () (do-times 1000 (spawn-fiber (lambda () (sleep 1))))) #:drain? #t): ok (1.033895667 s) +assert terminates: (run-fibers (lambda () (do-times 100 (spawn-fiber (lambda () (sleep 1))))) #:drain? #t): ok (1.156295276 s) +thread count: 2 vs 3 +assert terminates: (run-fibers (lambda () (do-times 1000 (spawn-fiber (lambda () (sleep 1))))) #:drain? #t): ok (1.181243672 s) +thread count: 3 vs 3 +assert terminates: (run-fibers (lambda () (do-times 10000 (spawn-fiber (lambda () (sleep 1))))) #:drain? #t): ok (2.537122371 s) thread count: 2 vs 2 -assert terminates: (run-fibers (lambda () (do-times 10000 (spawn-fiber (lambda () (sleep 1))))) #:drain? #t): ok (1.08236236 s) +assert terminates: (run-fibers (lambda () (do-times 100000 (spawn-fiber (lambda () (sleep 1))))) #:drain? #t): ok (2.189767199 s) thread count: 2 vs 2 -assert terminates: (run-fibers (lambda () (do-times 100000 (spawn-fiber (lambda () (sleep 1))))) #:drain? #t): ok (1.479706237 s) +assert terminates: (run-fibers (lambda () (spawn-fiber-tree 7 (lambda () (sleep 1)))) #:drain? #t): ok (1.17137689 s) thread count: 2 vs 2 -assert terminates: (run-fibers (lambda () (spawn-fiber-tree 7 (lambda () (sleep 1)))) #:drain? #t): ok (1.110791951 s) +assert terminates: (run-fibers (lambda () (spawn-fiber-chain 5)) #:drain? #t): ok (0.162914987 s) thread count: 2 vs 2 -assert terminates: (run-fibers (lambda () (spawn-fiber-chain 5)) #:drain? #t): ok (0.029001298 s) +assert terminates: (run-fibers (lambda () (spawn-fiber-chain 50)) #:drain? #t): ok (0.147897243 s) thread count: 2 vs 2 -assert terminates: (run-fibers (lambda () (spawn-fiber-chain 50)) #:drain? #t): ok (0.019727375 s) +assert terminates: (run-fibers (lambda () (spawn-fiber-chain 500)) #:drain? #t): ok (0.11250509 s) thread count: 2 vs 2 -assert terminates: (run-fibers (lambda () (spawn-fiber-chain 500)) #:drain? #t): ok (0.046446146 s) +assert terminates: (run-fibers (lambda () (spawn-fiber-chain 5000)) #:drain? #t): ok (0.214361607 s) thread count: 2 vs 2 -assert terminates: (run-fibers (lambda () (spawn-fiber-chain 5000)) #:drain? #t): ok (0.044559019 s) +assert terminates: (run-fibers (lambda () (spawn-fiber-chain 50000)) #:drain? #t): ok (0.593590638 s) thread count: 2 vs 2 -assert terminates: (run-fibers (lambda () (spawn-fiber-chain 50000)) #:drain? #t): ok (0.189680437 s) +assert terminates: (run-fibers (lambda () (spawn-fiber-chain 500000)) #:drain? #t): ok (5.594881243 s) thread count: 2 vs 2 -assert terminates: (run-fibers (lambda () (spawn-fiber-chain 500000)) #:drain? #t): ok (1.63453684 s) +assert terminates: (run-fibers (lambda () (test-run-order 10)) #:parallelism 1 #:drain? #t): ok (0.019541062 s) thread count: 2 vs 2 -assert terminates: (run-fibers (lambda () (test-run-order 10)) #:parallelism 1 #:drain? #t): ok (0.004731445 s) +assert terminates: (run-fibers (lambda () (test-wakeup-order 10)) #:parallelism 1 #:drain? #t): ok (0.002892329 s) thread count: 2 vs 2 -assert terminates: (run-fibers (lambda () (test-wakeup-order 10)) #:parallelism 1 #:drain? #t): ok (4.21688e-4 s) -thread count: 2 vs 2 -assert terminates: (run-fibers (lambda () 1) #:drain? #t): ok (0.024429585 s) +assert terminates: (run-fibers (lambda () 1) #:drain? #t): ok (0.091727701 s) thread count: 2 vs 2 assert run-fiber-return-vals equal to (1): ok -assert terminates: (run-fibers (lambda () (do-times 20 (check-sleep (random 1.0)))) #:drain? #t): assert sleep 0.13656801876667013s < actual 0.13710399s: #t (diff: 0.3924573543426735%) -assert sleep 0.14223792010421765s < actual 0.142775121s: #t (diff: 0.37767769339480345%) -assert sleep 0.17619092555590077s < actual 0.17634839s: #t (diff: 0.08937148357806107%) -assert sleep 0.18710264541783442s < actual 0.187360566s: #t (diff: 0.13784977844092183%) -assert sleep 0.19977805276916086s < actual 0.199954106s: #t (diff: 0.08812441026370427%) -assert sleep 0.24619027840495844s < actual 0.246611555s: #t (diff: 0.17111829019853164%) -assert sleep 0.30222335114870175s < actual 0.302701427s: #t (diff: 0.15818627167000426%) -assert sleep 0.35867985986774303s < actual 0.358810268s: #t (diff: 0.03635780729507357%) -assert sleep 0.40237002838139946s < actual 0.402823702s: #t (diff: 0.11275035082148768%) -assert sleep 0.4695651001149362s < actual 0.469955094s: #t (diff: 0.08305427404387028%) -assert sleep 0.5779752957924716s < actual 0.579431463s: #t (diff: 0.2519428110732339%) -assert sleep 0.6176813923438401s < actual 0.617778898s: #t (diff: 0.015785752552760834%) -assert sleep 0.6236182210668649s < actual 0.624039918s: #t (diff: 0.06762100895860151%) -assert sleep 0.6547869648462141s < actual 0.654996908s: #t (diff: 0.03206281814653583%) -assert sleep 0.6686815484384291s < actual 0.669137073s: #t (diff: 0.06812279516830202%) -assert sleep 0.6838663070459677s < actual 0.684394002s: #t (diff: 0.07716346727355217%) -assert sleep 0.870085735878438s < actual 0.870659066s: #t (diff: 0.06589352036477045%) -assert sleep 0.8920795776224772s < actual 0.892501068s: #t (diff: 0.04724806935341326%) -assert sleep 0.9106104424205086s < actual 0.910856437s: #t (diff: 0.027014249785834728%) -assert sleep 0.9799456531012519s < actual 0.981545226s: #t (diff: 0.1632307764911174%) -ok (1.019609442 s) +assert terminates: (run-fibers (lambda () (do-times 20 (check-sleep (random 1.0)))) #:drain? #t): assert sleep 0.09968581247946182s < actual 0.099937412s: #t (diff: 0.2523925062957419%) +assert sleep 0.12033749286947902s < actual 0.123279897s: #t (diff: 2.4451266686371653%) +assert sleep 0.14677873343285602s < actual 0.147023569s: #t (diff: 0.16680588626006204%) +assert sleep 0.161061830603866s < actual 0.163367953s: #t (diff: 1.4318242798357055%) +assert sleep 0.24963979839645514s < actual 0.24998294s: #t (diff: 0.13745468701264454%) +assert sleep 0.25424371614244934s < actual 0.255050466s: #t (diff: 0.3173135878405058%) +assert sleep 0.37824949804619856s < actual 0.378774696s: #t (diff: 0.13884961024781398%) +assert sleep 0.39476439585067746s < actual 0.395170822s: #t (diff: 0.10295410467469002%) +assert sleep 0.43128600266141104s < actual 0.431744233s: #t (diff: 0.10624744039019526%) +assert sleep 0.43590821911902305s < actual 0.436775178s: #t (diff: 0.1988856467834142%) +assert sleep 0.4407933893834s < actual 0.441441423s: #t (diff: 0.14701527568425693%) +assert sleep 0.4459989552537511s < actual 0.446412134s: #t (diff: 0.09264119150544467%) +assert sleep 0.49332848160681897s < actual 0.495381436s: #t (diff: 0.41614349662001404%) +assert sleep 0.5458597395831045s < actual 0.546068027s: #t (diff: 0.038157680772458034%) +assert sleep 0.5673504236761108s < actual 0.567524828s: #t (diff: 0.030740141649886144%) +assert sleep 0.5895356038786966s < actual 0.590102082s: #t (diff: 0.09608887361109274%) +assert sleep 0.7259203657774039s < actual 0.727323568s: #t (diff: 0.19329974591542493%) +assert sleep 0.8282886896434677s < actual 0.828837421s: #t (diff: 0.06624880472151884%) +assert sleep 0.8924559302997117s < actual 0.892574592s: #t (diff: 0.013296085135368172%) +assert sleep 0.9608598358887193s < actual 0.961269671s: #t (diff: 0.04265295477791747%) +ok (1.075019961 s) thread count: 2 vs 2 PASS: tests/basic.scm Testing dynamic-wind* ... @@ -834,25 +870,25 @@ ok! PASS: tests/dynamic-wind-star.scm assert (condition? cv) equal to #t: ok -assert run-fibers on (wait/timeout cv) terminates: ok (0.201987535 s) +assert run-fibers on (wait/timeout cv) terminates: ok (0.244655041 s) assert run-fiber-return-vals equal to (#f): ok -assert run-fibers on (wait/timeout cv) terminates: ok (0.077057656 s) +assert run-fibers on (wait/timeout cv) terminates: ok (0.195294655 s) assert run-fiber-return-vals equal to (#f): ok assert (signal-condition! cv) equal to #t: ok assert (signal-condition! cv) equal to #f: ok -assert run-fibers on (wait/timeout cv) terminates: ok (0.026222758 s) +assert run-fibers on (wait/timeout cv) terminates: ok (0.077578763 s) assert run-fiber-return-vals equal to (#t): ok -assert run-fibers on (wait/timeout cv) terminates: ok (0.036500078 s) +assert run-fibers on (wait/timeout cv) terminates: ok (0.096452787 s) assert run-fiber-return-vals equal to (#t): ok -assert run-fibers on (let ((cv (make-condition))) (spawn-fiber (lambda () (signal-condition! cv))) (wait cv) #t) terminates: ok (0.018565048 s) +assert run-fibers on (let ((cv (make-condition))) (spawn-fiber (lambda () (signal-condition! cv))) (wait cv) #t) terminates: ok (0.969248958 s) assert run-fiber-return-vals equal to (#t): ok assert (let ((cv (make-condition))) (run-fibers (lambda () (spawn-fiber (lambda () (wait cv))) (yield-current-task)) #:drain? #f #:hz 0 #:parallelism 1) (signal-condition! cv)) equal to #t: ok PASS: tests/conditions.scm -assert run-fibers on (rpc 1) terminates: ok (0.15464236 s) +assert run-fibers on (rpc 1) terminates: ok (0.179049594 s) assert run-fiber-return-vals equal to (1): ok -assert run-fibers on (rpc-fib 24) terminates: ok (1.615570747 s) +assert run-fibers on (rpc-fib 24) terminates: ok (5.915389147 s) assert run-fiber-return-vals equal to (75025): ok -assert run-fibers on (pingpong (current-processor-count) 1000) terminates: ok (0.066816426 s) +assert run-fibers on (pingpong (current-processor-count) 1000) terminates: ok (0.282498481 s) PASS: tests/channels.scm assert #f equal to #f: ok assert #t terminates: ok @@ -862,49 +898,49 @@ assert (send-to-fiber 42) equal to 42: WARNING: (tests foreign): imported module (fibers) overrides core binding `sleep' ok PASS: tests/foreign.scm -assert run-fibers on (readable/timeout? s) terminates: ok (0.218328397 s) +assert run-fibers on (readable/timeout? s) terminates: ok (0.27371859 s) assert run-fiber-return-vals equal to (#t): ok assert (readable/timeout? s) equal to #t: ok -assert run-fibers on (readable/timeout? A) terminates: ok (0.092954596 s) +assert run-fibers on (readable/timeout? A) terminates: ok (0.172709584 s) assert run-fiber-return-vals equal to (#t): ok assert (readable/timeout? A) equal to #t: ok -assert run-fibers on (writable/timeout? B) terminates: ok (0.03229848 s) +assert run-fibers on (writable/timeout? B) terminates: ok (0.08697455 s) assert run-fiber-return-vals equal to (#f): ok assert (writable/timeout? B) equal to #f: ok -assert run-fibers on (writable/timeout? B) terminates: ok (0.096507954 s) +assert run-fibers on (writable/timeout? B) terminates: ok (0.168777831 s) assert run-fiber-return-vals equal to (#t): ok -assert run-fibers on (readable/timeout? A) terminates: ok (0.059732122 s) +assert run-fibers on (readable/timeout? A) terminates: ok (0.137901201 s) assert run-fiber-return-vals equal to (#f): ok -assert run-fibers on (accept*/timeout? s) terminates: ok (0.085638316 s) +assert run-fibers on (accept*/timeout? s) terminates: ok (0.221679517 s) assert run-fiber-return-vals equal to (#t): ok assert accepted-socket equal to #f: ok assert (accept*/timeout? s) equal to #t: ok assert accepted-socket equal to #f: ok -assert run-fibers on (accept*/timeout? s) terminates: ok (0.050823879 s) +assert run-fibers on (accept*/timeout? s) terminates: ok (0.091971033 s) assert run-fiber-return-vals equal to (#f): ok assert (pair? accepted-socket) equal to #t: ok PASS: tests/io-wakeup.scm -assert run-fibers on (my-param) terminates: ok (0.14764561 s) +assert run-fibers on (my-param) terminates: ok (0.220826773 s) assert run-fiber-return-vals equal to (#f): ok -assert run-fibers on (rpc (my-param)) terminates: ok (0.036250036 s) +assert run-fibers on (rpc (my-param)) terminates: ok (0.154286877 s) assert run-fiber-return-vals equal to (#f): ok -assert run-fibers on (rpc (begin (my-param 42) (my-param))) terminates: ok (0.028717765 s) +assert run-fibers on (rpc (begin (my-param 42) (my-param))) terminates: ok (0.147852412 s) assert run-fiber-return-vals equal to (42): ok -assert run-fibers on (my-param) terminates: ok (0.032875422 s) +assert run-fibers on (my-param) terminates: ok (0.142739816 s) assert run-fiber-return-vals equal to (#f): ok -assert run-fibers on (begin (my-param 100) (rpc (my-param))) terminates: ok (0.032626724 s) +assert run-fibers on (begin (my-param 100) (rpc (my-param))) terminates: ok (0.146133805 s) assert run-fiber-return-vals equal to (100): ok -assert run-fibers on (my-param) terminates: ok (0.018813703 s) +assert run-fibers on (my-param) terminates: ok (0.120651093 s) assert run-fiber-return-vals equal to (#f): ok assert (my-param) equal to #f: ok assert (begin (my-param (quote foo)) (my-param)) equal to foo: ok -assert run-fibers on (my-param) terminates: ok (0.023609937 s) +assert run-fibers on (my-param) terminates: ok (0.127255844 s) assert run-fiber-return-vals equal to (foo): ok -assert run-fibers on (rpc (my-param)) terminates: ok (0.025359081 s) +assert run-fibers on (rpc (my-param)) terminates: ok (0.16774145 s) assert run-fiber-return-vals equal to (foo): ok PASS: tests/parameters.scm -assert run-fibers on (let lp ((n 0)) (when (< n 20000000) (lp (#{1+}# n)))) terminates: ok (3.125859615 s) -assert run-fibers on (race-until 100) terminates: ok (0.070264734 s) +assert run-fibers on (let lp ((n 0)) (when (< n 20000000) (lp (#{1+}# n)))) terminates: ok (10.129477553 s) +assert run-fibers on (race-until 100) terminates: ok (0.286325769 s) assert run-fiber-return-vals equal to (100): ok PASS: tests/preemption.scm @@ -915,6 +951,8 @@ PASS: tests/timer-wheel.scm final heap size: 5.12 MiB; initial heap size: 3.84 MiB PASS: tests/cancel-timer.scm +WARNING: (tests ports): imported module (fibers) overrides core binding `sleep' +success ;;; (listening-socket #) @@ -928,15 +966,13 @@ ;;; (listening-socket #) -;;; (accepted-connection (# . #(2 2130706433 47234))) +;;; (accepted-connection (# . #(2 2130706433 43022))) -;;; (connected #(2 2130706433 36821)) +;;; (connected #(2 2130706433 35711)) ;;; (received "hello!") ;;; (echo "hello!") -WARNING: (tests ports): imported module (fibers) overrides core binding `sleep' -success PASS: tests/ports.scm assert (length data) equal to 10000: ok assert (length data) equal to 10000: ok @@ -962,7 +998,7 @@ make[4]: Entering directory '/build/reproducible-path/guile-fibers-1.4.1' make[4]: Nothing to be done for 'install-exec-am'. /usr/bin/mkdir -p '/build/reproducible-path/guile-fibers-1.4.1/debian/tmp/usr/lib/x86_64-linux-gnu/guile/3.0/extensions' - /bin/bash ./libtool --mode=install /usr/bin/install -c fibers-epoll.la '/build/reproducible-path/guile-fibers-1.4.1/debian/tmp/usr/lib/x86_64-linux-gnu/guile/3.0/extensions' + /bin/sh ./libtool --mode=install /usr/bin/install -c fibers-epoll.la '/build/reproducible-path/guile-fibers-1.4.1/debian/tmp/usr/lib/x86_64-linux-gnu/guile/3.0/extensions' libtool: install: /usr/bin/install -c .libs/fibers-epoll.so.0.0.0 /build/reproducible-path/guile-fibers-1.4.1/debian/tmp/usr/lib/x86_64-linux-gnu/guile/3.0/extensions/fibers-epoll.so.0.0.0 libtool: install: (cd /build/reproducible-path/guile-fibers-1.4.1/debian/tmp/usr/lib/x86_64-linux-gnu/guile/3.0/extensions && { ln -s -f fibers-epoll.so.0.0.0 fibers-epoll.so.0 || { rm -f fibers-epoll.so.0 && ln -s fibers-epoll.so.0.0.0 fibers-epoll.so.0; }; }) libtool: install: (cd /build/reproducible-path/guile-fibers-1.4.1/debian/tmp/usr/lib/x86_64-linux-gnu/guile/3.0/extensions && { ln -s -f fibers-epoll.so.0.0.0 fibers-epoll.so || { rm -f fibers-epoll.so && ln -s fibers-epoll.so.0.0.0 fibers-epoll.so; }; }) @@ -1019,8 +1055,8 @@ dh_gencontrol -O--builddirectory=. dh_md5sums -O--builddirectory=. dh_builddeb -O--builddirectory=. -dpkg-deb: building package 'guile-fibers' in '../guile-fibers_1.4.1-2_amd64.deb'. dpkg-deb: building package 'guile-fibers-dbgsym' in '../guile-fibers-dbgsym_1.4.1-2_amd64.deb'. +dpkg-deb: building package 'guile-fibers' in '../guile-fibers_1.4.1-2_amd64.deb'. dpkg-genbuildinfo --build=binary -O../guile-fibers_1.4.1-2_amd64.buildinfo dpkg-genchanges --build=binary -O../guile-fibers_1.4.1-2_amd64.changes dpkg-genchanges: info: binary-only upload (no source code included) @@ -1028,12 +1064,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/3950443/tmp/hooks/B01_cleanup starting +I: user script /srv/workspace/pbuilder/3950443/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/3523896 and its subdirectories -I: Current time: Sat Nov 14 03:51:45 -12 2026 -I: pbuilder-time-stamp: 1794671505 +I: removing directory /srv/workspace/pbuilder/3950443 and its subdirectories +I: Current time: Sun Oct 12 23:34:37 +14 2025 +I: pbuilder-time-stamp: 1760261677