Diff of the two buildlogs: -- --- b1/build.log 2023-04-20 14:14:38.796073304 +0000 +++ b2/build.log 2023-04-20 14:16:18.235658274 +0000 @@ -1,6 +1,6 @@ I: pbuilder: network access will be disabled during build -I: Current time: Wed May 22 08:36:39 -12 2024 -I: pbuilder-time-stamp: 1716410199 +I: Current time: Fri Apr 21 04:14:40 +14 2023 +I: pbuilder-time-stamp: 1682000080 I: Building the build Environment I: extracting base tarball [/var/cache/pbuilder/bookworm-reproducible-base.tgz] I: copying local configuration @@ -17,7 +17,7 @@ I: copying [./chasquid_1.11.orig.tar.xz] I: copying [./chasquid_1.11-2.debian.tar.xz] I: Extracting source -gpgv: Signature made Mon Feb 27 01:23:55 2023 -12 +gpgv: Signature made Tue Feb 28 03:23:55 2023 +14 gpgv: using EDDSA key A095B66EE09024BEE6A2F0722A27904BD7243EDA gpgv: Can't check signature: No public key dpkg-source: warning: cannot verify inline signature for ./chasquid_1.11-2.dsc: no acceptable signature found @@ -28,137 +28,169 @@ dpkg-source: info: applying 0001-Use_chasquid_user.patch I: Not using root during the build. I: Installing the build-deps -I: user script /srv/workspace/pbuilder/93536/tmp/hooks/D02_print_environment starting +I: user script /srv/workspace/pbuilder/32447/tmp/hooks/D01_modify_environment starting +debug: Running on ionos12-i386. +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 Apr 21 04:14 /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/32447/tmp/hooks/D01_modify_environment finished +I: user script /srv/workspace/pbuilder/32447/tmp/hooks/D02_print_environment starting I: set - BUILDDIR='/build' - BUILDUSERGECOS='first user,first room,first work-phone,first home-phone,first other' - BUILDUSERNAME='pbuilder1' - BUILD_ARCH='i386' - DEBIAN_FRONTEND='noninteractive' - DEB_BUILD_OPTIONS='buildinfo=+all reproducible=+all parallel=16' - DISTRIBUTION='bookworm' - HOME='/root' - HOST_ARCH='i386' + 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]="15" [3]="1" [4]="release" [5]="i686-pc-linux-gnu") + BASH_VERSION='5.2.15(1)-release' + BUILDDIR=/build + BUILDUSERGECOS='second user,second room,second work-phone,second home-phone,second other' + BUILDUSERNAME=pbuilder2 + BUILD_ARCH=i386 + DEBIAN_FRONTEND=noninteractive + DEB_BUILD_OPTIONS='buildinfo=+all reproducible=+all parallel=7' + DIRSTACK=() + DISTRIBUTION=bookworm + EUID=0 + FUNCNAME=([0]="Echo" [1]="main") + GROUPS=() + HOME=/root + HOSTNAME=i-capture-the-hostname + HOSTTYPE=i686 + HOST_ARCH=i386 IFS=' ' - INVOCATION_ID='ad1fc2f87bba473ea338fe777916febc' - LANG='C' - LANGUAGE='en_US:en' - LC_ALL='C' - LD_LIBRARY_PATH='/usr/lib/libeatmydata' - LD_PRELOAD='libeatmydata.so' - 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='93536' - PS1='# ' - PS2='> ' + INVOCATION_ID=eed1f6bfdc144a54adc30bd5904b9ea1 + LANG=C + LANGUAGE=de_CH:de + LC_ALL=C + LD_LIBRARY_PATH=/usr/lib/libeatmydata + LD_PRELOAD=libeatmydata.so + MACHTYPE=i686-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=32447 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.BRryfOH2/pbuilderrc_tiur --distribution bookworm --hookdir /etc/pbuilder/first-build-hooks --debbuildopts -b --basetgz /var/cache/pbuilder/bookworm-reproducible-base.tgz --buildresult /srv/reproducible-results/rbuild-debian/r-b-build.BRryfOH2/b1 --logfile b1/build.log chasquid_1.11-2.dsc' - SUDO_GID='112' - SUDO_UID='107' - SUDO_USER='jenkins' - TERM='unknown' - TZ='/usr/share/zoneinfo/Etc/GMT+12' - USER='root' - _='/usr/bin/systemd-run' - http_proxy='http://85.184.249.68: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.BRryfOH2/pbuilderrc_oopM --distribution bookworm --hookdir /etc/pbuilder/rebuild-hooks --debbuildopts -b --basetgz /var/cache/pbuilder/bookworm-reproducible-base.tgz --buildresult /srv/reproducible-results/rbuild-debian/r-b-build.BRryfOH2/b2 --logfile b2/build.log --extrapackages usrmerge chasquid_1.11-2.dsc' + SUDO_GID=112 + SUDO_UID=107 + SUDO_USER=jenkins + TERM=unknown + TZ=/usr/share/zoneinfo/Etc/GMT-14 + UID=0 + USER=root + _='I: set' + http_proxy=http://78.137.99.97:3128 I: uname -a - Linux ionos16-i386 5.10.0-21-amd64 #1 SMP Debian 5.10.162-1 (2023-01-21) x86_64 GNU/Linux + Linux i-capture-the-hostname 5.10.0-21-686-pae #1 SMP Debian 5.10.162-1 (2023-01-21) i686 GNU/Linux I: ls -l /bin total 6036 - -rwxr-xr-x 1 root root 1408088 Feb 12 2023 bash - -rwxr-xr-x 3 root root 38404 Sep 18 2022 bunzip2 - -rwxr-xr-x 3 root root 38404 Sep 18 2022 bzcat - lrwxrwxrwx 1 root root 6 Sep 18 2022 bzcmp -> bzdiff - -rwxr-xr-x 1 root root 2225 Sep 18 2022 bzdiff - lrwxrwxrwx 1 root root 6 Sep 18 2022 bzegrep -> bzgrep - -rwxr-xr-x 1 root root 4893 Nov 27 2021 bzexe - lrwxrwxrwx 1 root root 6 Sep 18 2022 bzfgrep -> bzgrep - -rwxr-xr-x 1 root root 3775 Sep 18 2022 bzgrep - -rwxr-xr-x 3 root root 38404 Sep 18 2022 bzip2 - -rwxr-xr-x 1 root root 17892 Sep 18 2022 bzip2recover - lrwxrwxrwx 1 root root 6 Sep 18 2022 bzless -> bzmore - -rwxr-xr-x 1 root root 1297 Sep 18 2022 bzmore - -rwxr-xr-x 1 root root 42920 Sep 20 2022 cat - -rwxr-xr-x 1 root root 79816 Sep 20 2022 chgrp - -rwxr-xr-x 1 root root 67496 Sep 20 2022 chmod - -rwxr-xr-x 1 root root 79816 Sep 20 2022 chown - -rwxr-xr-x 1 root root 162024 Sep 20 2022 cp - -rwxr-xr-x 1 root root 136916 Jan 5 2023 dash - -rwxr-xr-x 1 root root 137160 Sep 20 2022 date - -rwxr-xr-x 1 root root 100364 Sep 20 2022 dd - -rwxr-xr-x 1 root root 108940 Sep 20 2022 df - -rwxr-xr-x 1 root root 162152 Sep 20 2022 dir - -rwxr-xr-x 1 root root 87760 Mar 22 2023 dmesg - lrwxrwxrwx 1 root root 8 Dec 19 2022 dnsdomainname -> hostname - lrwxrwxrwx 1 root root 8 Dec 19 2022 domainname -> hostname - -rwxr-xr-x 1 root root 38760 Sep 20 2022 echo - -rwxr-xr-x 1 root root 41 Jan 24 2023 egrep - -rwxr-xr-x 1 root root 34664 Sep 20 2022 false - -rwxr-xr-x 1 root root 41 Jan 24 2023 fgrep - -rwxr-xr-x 1 root root 84272 Mar 22 2023 findmnt - -rwsr-xr-x 1 root root 30240 Mar 22 2023 fusermount - -rwxr-xr-x 1 root root 218680 Jan 24 2023 grep - -rwxr-xr-x 2 root root 2346 Apr 9 2022 gunzip - -rwxr-xr-x 1 root root 6447 Apr 9 2022 gzexe - -rwxr-xr-x 1 root root 100952 Apr 9 2022 gzip - -rwxr-xr-x 1 root root 21916 Dec 19 2022 hostname - -rwxr-xr-x 1 root root 75756 Sep 20 2022 ln - -rwxr-xr-x 1 root root 55600 Mar 22 2023 login - -rwxr-xr-x 1 root root 162152 Sep 20 2022 ls - -rwxr-xr-x 1 root root 214568 Mar 22 2023 lsblk - -rwxr-xr-x 1 root root 96328 Sep 20 2022 mkdir - -rwxr-xr-x 1 root root 84008 Sep 20 2022 mknod - -rwxr-xr-x 1 root root 38792 Sep 20 2022 mktemp - -rwxr-xr-x 1 root root 63016 Mar 22 2023 more - -rwsr-xr-x 1 root root 58912 Mar 22 2023 mount - -rwxr-xr-x 1 root root 13856 Mar 22 2023 mountpoint - -rwxr-xr-x 1 root root 157932 Sep 20 2022 mv - lrwxrwxrwx 1 root root 8 Dec 19 2022 nisdomainname -> hostname - lrwxrwxrwx 1 root root 14 Apr 2 2023 pidof -> /sbin/killall5 - -rwxr-xr-x 1 root root 38792 Sep 20 2022 pwd - lrwxrwxrwx 1 root root 4 Feb 12 2023 rbash -> bash - -rwxr-xr-x 1 root root 51080 Sep 20 2022 readlink - -rwxr-xr-x 1 root root 75720 Sep 20 2022 rm - -rwxr-xr-x 1 root root 51080 Sep 20 2022 rmdir - -rwxr-xr-x 1 root root 22308 Nov 2 2022 run-parts - -rwxr-xr-x 1 root root 133224 Jan 5 2023 sed - lrwxrwxrwx 1 root root 4 Jan 5 2023 sh -> dash - -rwxr-xr-x 1 root root 38760 Sep 20 2022 sleep - -rwxr-xr-x 1 root root 87976 Sep 20 2022 stty - -rwsr-xr-x 1 root root 83492 Mar 22 2023 su - -rwxr-xr-x 1 root root 38792 Sep 20 2022 sync - -rwxr-xr-x 1 root root 598456 Apr 6 2023 tar - -rwxr-xr-x 1 root root 13860 Nov 2 2022 tempfile - -rwxr-xr-x 1 root root 120776 Sep 20 2022 touch - -rwxr-xr-x 1 root root 34664 Sep 20 2022 true - -rwxr-xr-x 1 root root 17892 Mar 22 2023 ulockmgr_server - -rwsr-xr-x 1 root root 30236 Mar 22 2023 umount - -rwxr-xr-x 1 root root 38760 Sep 20 2022 uname - -rwxr-xr-x 2 root root 2346 Apr 9 2022 uncompress - -rwxr-xr-x 1 root root 162152 Sep 20 2022 vdir - -rwxr-xr-x 1 root root 71216 Mar 22 2023 wdctl - lrwxrwxrwx 1 root root 8 Dec 19 2022 ypdomainname -> hostname - -rwxr-xr-x 1 root root 1984 Apr 9 2022 zcat - -rwxr-xr-x 1 root root 1678 Apr 9 2022 zcmp - -rwxr-xr-x 1 root root 6460 Apr 9 2022 zdiff - -rwxr-xr-x 1 root root 29 Apr 9 2022 zegrep - -rwxr-xr-x 1 root root 29 Apr 9 2022 zfgrep - -rwxr-xr-x 1 root root 2081 Apr 9 2022 zforce - -rwxr-xr-x 1 root root 8103 Apr 9 2022 zgrep - -rwxr-xr-x 1 root root 2206 Apr 9 2022 zless - -rwxr-xr-x 1 root root 1842 Apr 9 2022 zmore - -rwxr-xr-x 1 root root 4577 Apr 9 2022 znew -I: user script /srv/workspace/pbuilder/93536/tmp/hooks/D02_print_environment finished + -rwxr-xr-x 1 root root 1408088 Feb 13 10:21 bash + -rwxr-xr-x 3 root root 38404 Sep 19 2022 bunzip2 + -rwxr-xr-x 3 root root 38404 Sep 19 2022 bzcat + lrwxrwxrwx 1 root root 6 Sep 19 2022 bzcmp -> bzdiff + -rwxr-xr-x 1 root root 2225 Sep 19 2022 bzdiff + lrwxrwxrwx 1 root root 6 Sep 19 2022 bzegrep -> bzgrep + -rwxr-xr-x 1 root root 4893 Nov 28 2021 bzexe + lrwxrwxrwx 1 root root 6 Sep 19 2022 bzfgrep -> bzgrep + -rwxr-xr-x 1 root root 3775 Sep 19 2022 bzgrep + -rwxr-xr-x 3 root root 38404 Sep 19 2022 bzip2 + -rwxr-xr-x 1 root root 17892 Sep 19 2022 bzip2recover + lrwxrwxrwx 1 root root 6 Sep 19 2022 bzless -> bzmore + -rwxr-xr-x 1 root root 1297 Sep 19 2022 bzmore + -rwxr-xr-x 1 root root 42920 Sep 21 2022 cat + -rwxr-xr-x 1 root root 79816 Sep 21 2022 chgrp + -rwxr-xr-x 1 root root 67496 Sep 21 2022 chmod + -rwxr-xr-x 1 root root 79816 Sep 21 2022 chown + -rwxr-xr-x 1 root root 162024 Sep 21 2022 cp + -rwxr-xr-x 1 root root 136916 Jan 6 03:20 dash + -rwxr-xr-x 1 root root 137160 Sep 21 2022 date + -rwxr-xr-x 1 root root 100364 Sep 21 2022 dd + -rwxr-xr-x 1 root root 108940 Sep 21 2022 df + -rwxr-xr-x 1 root root 162152 Sep 21 2022 dir + -rwxr-xr-x 1 root root 87760 Mar 24 00:20 dmesg + lrwxrwxrwx 1 root root 8 Dec 20 03:33 dnsdomainname -> hostname + lrwxrwxrwx 1 root root 8 Dec 20 03:33 domainname -> hostname + -rwxr-xr-x 1 root root 38760 Sep 21 2022 echo + -rwxr-xr-x 1 root root 41 Jan 25 04:43 egrep + -rwxr-xr-x 1 root root 34664 Sep 21 2022 false + -rwxr-xr-x 1 root root 41 Jan 25 04:43 fgrep + -rwxr-xr-x 1 root root 84272 Mar 24 00:20 findmnt + -rwsr-xr-x 1 root root 30240 Mar 23 22:38 fusermount + -rwxr-xr-x 1 root root 218680 Jan 25 04:43 grep + -rwxr-xr-x 2 root root 2346 Apr 10 2022 gunzip + -rwxr-xr-x 1 root root 6447 Apr 10 2022 gzexe + -rwxr-xr-x 1 root root 100952 Apr 10 2022 gzip + -rwxr-xr-x 1 root root 21916 Dec 20 03:33 hostname + -rwxr-xr-x 1 root root 75756 Sep 21 2022 ln + -rwxr-xr-x 1 root root 55600 Mar 24 01:43 login + -rwxr-xr-x 1 root root 162152 Sep 21 2022 ls + -rwxr-xr-x 1 root root 214568 Mar 24 00:20 lsblk + -rwxr-xr-x 1 root root 96328 Sep 21 2022 mkdir + -rwxr-xr-x 1 root root 84008 Sep 21 2022 mknod + -rwxr-xr-x 1 root root 38792 Sep 21 2022 mktemp + -rwxr-xr-x 1 root root 63016 Mar 24 00:20 more + -rwsr-xr-x 1 root root 58912 Mar 24 00:20 mount + -rwxr-xr-x 1 root root 13856 Mar 24 00:20 mountpoint + -rwxr-xr-x 1 root root 157932 Sep 21 2022 mv + lrwxrwxrwx 1 root root 8 Dec 20 03:33 nisdomainname -> hostname + lrwxrwxrwx 1 root root 14 Apr 3 20:25 pidof -> /sbin/killall5 + -rwxr-xr-x 1 root root 38792 Sep 21 2022 pwd + lrwxrwxrwx 1 root root 4 Feb 13 10:21 rbash -> bash + -rwxr-xr-x 1 root root 51080 Sep 21 2022 readlink + -rwxr-xr-x 1 root root 75720 Sep 21 2022 rm + -rwxr-xr-x 1 root root 51080 Sep 21 2022 rmdir + -rwxr-xr-x 1 root root 22308 Nov 3 06:31 run-parts + -rwxr-xr-x 1 root root 133224 Jan 6 09:55 sed + lrwxrwxrwx 1 root root 9 Apr 21 04:14 sh -> /bin/bash + -rwxr-xr-x 1 root root 38760 Sep 21 2022 sleep + -rwxr-xr-x 1 root root 87976 Sep 21 2022 stty + -rwsr-xr-x 1 root root 83492 Mar 24 00:20 su + -rwxr-xr-x 1 root root 38792 Sep 21 2022 sync + -rwxr-xr-x 1 root root 598456 Apr 7 04:25 tar + -rwxr-xr-x 1 root root 13860 Nov 3 06:31 tempfile + -rwxr-xr-x 1 root root 120776 Sep 21 2022 touch + -rwxr-xr-x 1 root root 34664 Sep 21 2022 true + -rwxr-xr-x 1 root root 17892 Mar 23 22:38 ulockmgr_server + -rwsr-xr-x 1 root root 30236 Mar 24 00:20 umount + -rwxr-xr-x 1 root root 38760 Sep 21 2022 uname + -rwxr-xr-x 2 root root 2346 Apr 10 2022 uncompress + -rwxr-xr-x 1 root root 162152 Sep 21 2022 vdir + -rwxr-xr-x 1 root root 71216 Mar 24 00:20 wdctl + lrwxrwxrwx 1 root root 8 Dec 20 03:33 ypdomainname -> hostname + -rwxr-xr-x 1 root root 1984 Apr 10 2022 zcat + -rwxr-xr-x 1 root root 1678 Apr 10 2022 zcmp + -rwxr-xr-x 1 root root 6460 Apr 10 2022 zdiff + -rwxr-xr-x 1 root root 29 Apr 10 2022 zegrep + -rwxr-xr-x 1 root root 29 Apr 10 2022 zfgrep + -rwxr-xr-x 1 root root 2081 Apr 10 2022 zforce + -rwxr-xr-x 1 root root 8103 Apr 10 2022 zgrep + -rwxr-xr-x 1 root root 2206 Apr 10 2022 zless + -rwxr-xr-x 1 root root 1842 Apr 10 2022 zmore + -rwxr-xr-x 1 root root 4577 Apr 10 2022 znew +I: user script /srv/workspace/pbuilder/32447/tmp/hooks/D02_print_environment finished -> Attempting to satisfy build-dependencies -> Creating pbuilder-satisfydepends-dummy package Package: pbuilder-satisfydepends-dummy @@ -262,7 +294,7 @@ Get: 44 http://deb.debian.org/debian bookworm/main i386 golang-blitiri-go-log-dev all 1.1.0-1 [6724 B] Get: 45 http://deb.debian.org/debian bookworm/main i386 golang-blitiri-go-spf-dev all 1.5.1-1 [37.2 kB] Get: 46 http://deb.debian.org/debian bookworm/main i386 golang-blitiri-go-systemd-dev all 1.1.0-1 [6952 B] -Fetched 106 MB in 1s (73.8 MB/s) +Fetched 106 MB in 2s (63.6 MB/s) debconf: delaying package configuration, since apt-utils is not installed Selecting previously unselected package sensible-utils. (Reading database ... (Reading database ... 5% (Reading database ... 10% (Reading database ... 15% (Reading database ... 20% (Reading database ... 25% (Reading database ... 30% (Reading database ... 35% (Reading database ... 40% (Reading database ... 45% (Reading database ... 50% (Reading database ... 55% (Reading database ... 60% (Reading database ... 65% (Reading database ... 70% (Reading database ... 75% (Reading database ... 80% (Reading database ... 85% (Reading database ... 90% (Reading database ... 95% (Reading database ... 100% (Reading database ... 19604 files and directories currently installed.) @@ -460,8 +492,19 @@ Writing extended state information... Building tag database... -> Finished parsing the build-deps +Reading package lists... +Building dependency tree... +Reading state information... +usrmerge is already the newest version (35). +0 upgraded, 0 newly installed, 0 to remove and 0 not upgraded. I: Building the package -I: Running cd /build/chasquid-1.11/ && 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 > ../chasquid_1.11-2_source.changes +I: user script /srv/workspace/pbuilder/32447/tmp/hooks/A99_set_merged_usr starting +Re-configuring usrmerge... +removed '/etc/unsupported-skip-usrmerge-conversion' +The system has been successfully converted. +I: user script /srv/workspace/pbuilder/32447/tmp/hooks/A99_set_merged_usr finished +hostname: Name or service not known +I: Running cd /build/chasquid-1.11/ && 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 > ../chasquid_1.11-2_source.changes dpkg-buildpackage: info: source package chasquid dpkg-buildpackage: info: source version 1.11-2 dpkg-buildpackage: info: source distribution unstable @@ -481,225 +524,225 @@ debian/rules override_dh_auto_build make[1]: Entering directory '/build/chasquid-1.11' dh_auto_build -- -ldflags " -X main.version=1.11-2 -X main.sourceDateTs=1677503939" - cd obj-i686-linux-gnu && go install -trimpath -v -p 16 -ldflags " -X main.version=1.11-2 -X main.sourceDateTs=1677503939" blitiri.com.ar/go/chasquid blitiri.com.ar/go/chasquid/cmd/chasquid-util blitiri.com.ar/go/chasquid/cmd/mda-lmtp blitiri.com.ar/go/chasquid/cmd/smtp-check blitiri.com.ar/go/chasquid/internal/aliases blitiri.com.ar/go/chasquid/internal/auth blitiri.com.ar/go/chasquid/internal/config blitiri.com.ar/go/chasquid/internal/courier blitiri.com.ar/go/chasquid/internal/domaininfo blitiri.com.ar/go/chasquid/internal/dovecot blitiri.com.ar/go/chasquid/internal/envelope blitiri.com.ar/go/chasquid/internal/expvarom blitiri.com.ar/go/chasquid/internal/haproxy blitiri.com.ar/go/chasquid/internal/maillog blitiri.com.ar/go/chasquid/internal/nettrace blitiri.com.ar/go/chasquid/internal/normalize blitiri.com.ar/go/chasquid/internal/protoio blitiri.com.ar/go/chasquid/internal/protoio/testpb blitiri.com.ar/go/chasquid/internal/queue blitiri.com.ar/go/chasquid/internal/safeio blitiri.com.ar/go/chasquid/internal/set blitiri.com.ar/go/chasquid/internal/smtp blitiri.com.ar/go/chasquid/internal/smtpsrv blitiri.com.ar/go/chasquid/internal/sts blitiri.com.ar/go/chasquid/internal/testlib blitiri.com.ar/go/chasquid/internal/tlsconst blitiri.com.ar/go/chasquid/internal/trace blitiri.com.ar/go/chasquid/internal/userdb -internal/goarch + cd obj-i686-linux-gnu && go install -trimpath -v -p 7 -ldflags " -X main.version=1.11-2 -X main.sourceDateTs=1677503939" blitiri.com.ar/go/chasquid blitiri.com.ar/go/chasquid/cmd/chasquid-util blitiri.com.ar/go/chasquid/cmd/mda-lmtp blitiri.com.ar/go/chasquid/cmd/smtp-check blitiri.com.ar/go/chasquid/internal/aliases blitiri.com.ar/go/chasquid/internal/auth blitiri.com.ar/go/chasquid/internal/config blitiri.com.ar/go/chasquid/internal/courier blitiri.com.ar/go/chasquid/internal/domaininfo blitiri.com.ar/go/chasquid/internal/dovecot blitiri.com.ar/go/chasquid/internal/envelope blitiri.com.ar/go/chasquid/internal/expvarom blitiri.com.ar/go/chasquid/internal/haproxy blitiri.com.ar/go/chasquid/internal/maillog blitiri.com.ar/go/chasquid/internal/nettrace blitiri.com.ar/go/chasquid/internal/normalize blitiri.com.ar/go/chasquid/internal/protoio blitiri.com.ar/go/chasquid/internal/protoio/testpb blitiri.com.ar/go/chasquid/internal/queue blitiri.com.ar/go/chasquid/internal/safeio blitiri.com.ar/go/chasquid/internal/set blitiri.com.ar/go/chasquid/internal/smtp blitiri.com.ar/go/chasquid/internal/smtpsrv blitiri.com.ar/go/chasquid/internal/sts blitiri.com.ar/go/chasquid/internal/testlib blitiri.com.ar/go/chasquid/internal/tlsconst blitiri.com.ar/go/chasquid/internal/trace blitiri.com.ar/go/chasquid/internal/userdb +encoding internal/unsafeheader +internal/goarch +internal/cpu +runtime/internal/syscall internal/goos -internal/race +internal/itoa +runtime/internal/atomic internal/goexperiment +internal/abi +runtime/internal/math +runtime/internal/sys math/bits -runtime/internal/syscall -encoding -internal/cpu -internal/nettrace unicode/utf8 +internal/race sync/atomic -google.golang.org/protobuf/internal/flags -internal/itoa -runtime/internal/atomic +internal/bytealg unicode +internal/nettrace +google.golang.org/protobuf/internal/flags unicode/utf16 +google.golang.org/protobuf/internal/set container/ring +math container/list crypto/internal/subtle -internal/abi -runtime/internal/math -runtime/internal/sys crypto/subtle crypto/internal/boring/sig vendor/golang.org/x/crypto/cryptobyte/asn1 -blitiri.com.ar/go/chasquid/internal/set vendor/golang.org/x/crypto/internal/subtle -google.golang.org/protobuf/internal/set -math -internal/bytealg +blitiri.com.ar/go/chasquid/internal/set runtime internal/reflectlite sync -internal/singleflight internal/testlog +internal/singleflight google.golang.org/protobuf/internal/pragma internal/sysinfo math/rand runtime/cgo errors sort -internal/oserror -io internal/safefilepath +io path -vendor/golang.org/x/net/dns/dnsmessage +internal/oserror strconv -crypto/internal/nistec/fiat syscall +vendor/golang.org/x/net/dns/dnsmessage +crypto/internal/nistec/fiat golang.org/x/text/internal/tag -hash -crypto/internal/randutil strings -text/tabwriter -bytes +hash hash/fnv +bytes hash/crc32 reflect +html +bufio crypto +crypto/internal/randutil crypto/rc4 vendor/golang.org/x/text/transform -golang.org/x/text/transform -bufio net/http/internal/ascii -html +internal/syscall/unix +time +internal/syscall/execenv +golang.org/x/text/transform +text/tabwriter regexp/syntax golang.org/x/text/runes golang.org/x/text/width -internal/syscall/execenv -internal/syscall/unix -time regexp crypto/internal/nistec +internal/poll context io/fs -internal/poll embed -os internal/fmtsort encoding/binary +os encoding/base64 -crypto/cipher crypto/internal/edwards25519/field +crypto/md5 +crypto/cipher vendor/golang.org/x/crypto/curve25519/internal/field vendor/golang.org/x/crypto/internal/poly1305 -crypto/md5 -golang.org/x/sys/unix encoding/pem crypto/internal/edwards25519 -internal/godebug -google.golang.org/protobuf/internal/detrand -path/filepath -fmt -blitiri.com.ar/go/chasquid/internal/safeio -os/signal -io/ioutil +golang.org/x/sys/unix crypto/internal/boring crypto/des vendor/golang.org/x/crypto/chacha20 +fmt +internal/godebug internal/intern +path/filepath +net/netip +google.golang.org/protobuf/internal/detrand +io/ioutil +blitiri.com.ar/go/chasquid/internal/safeio crypto/aes crypto/sha512 crypto/hmac -net/netip crypto/sha1 crypto/sha256 -vendor/golang.org/x/crypto/hkdf -golang.org/x/crypto/pbkdf2 vendor/golang.org/x/crypto/chacha20poly1305 +vendor/golang.org/x/crypto/hkdf os/exec +golang.org/x/crypto/pbkdf2 +os/signal golang.org/x/crypto/scrypt net -google.golang.org/protobuf/internal/errors -log flag +log +google.golang.org/protobuf/internal/errors +google.golang.org/protobuf/encoding/protowire go/token -net/url -google.golang.org/protobuf/internal/version -vendor/golang.org/x/crypto/curve25519 -encoding/hex -vendor/golang.org/x/net/http2/hpack -text/template/parse compress/flate encoding/json -math/big -vendor/golang.org/x/text/unicode/norm -mime -google.golang.org/protobuf/encoding/protowire -mime/quotedprintable -net/http/internal -vendor/golang.org/x/text/unicode/bidi -blitiri.com.ar/go/chasquid/internal/envelope -golang.org/x/text/unicode/bidi google.golang.org/protobuf/reflect/protoreflect -golang.org/x/text/unicode/norm -golang.org/x/text/internal/language -blitiri.com.ar/go/chasquid/internal/tlsconst -runtime/trace -runtime/debug +google.golang.org/protobuf/internal/version +net/url +text/template/parse +math/big compress/gzip -testing -golang.org/x/term -golang.org/x/text/secure/bidirule -internal/profile -runtime/pprof +encoding/hex +google.golang.org/protobuf/internal/encoding/messageset google.golang.org/protobuf/internal/strs -google.golang.org/protobuf/internal/order google.golang.org/protobuf/internal/genid -google.golang.org/protobuf/internal/encoding/messageset +google.golang.org/protobuf/internal/order +google.golang.org/protobuf/reflect/protoregistry +google.golang.org/protobuf/internal/encoding/text google.golang.org/protobuf/runtime/protoiface google.golang.org/protobuf/internal/descfmt google.golang.org/protobuf/internal/descopts text/template -vendor/golang.org/x/text/secure/bidirule -google.golang.org/protobuf/internal/encoding/text -google.golang.org/protobuf/reflect/protoregistry -golang.org/x/text/internal/language/compact -vendor/golang.org/x/net/idna -golang.org/x/net/idna google.golang.org/protobuf/proto -golang.org/x/text/language +vendor/golang.org/x/crypto/curve25519 +vendor/golang.org/x/text/unicode/bidi google.golang.org/protobuf/internal/encoding/defval +vendor/golang.org/x/text/unicode/norm +vendor/golang.org/x/net/http2/hpack +mime +google.golang.org/protobuf/encoding/prototext +google.golang.org/protobuf/internal/filedesc crypto/rand -crypto/internal/boring/bbig +html/template crypto/elliptic -crypto/dsa +crypto/internal/boring/bbig encoding/asn1 crypto/ed25519 +blitiri.com.ar/go/chasquid/internal/protoio crypto/rsa -html/template -golang.org/x/text/internal -crypto/x509/pkix +crypto/dsa +vendor/golang.org/x/text/secure/bidirule +mime/quotedprintable +vendor/golang.org/x/net/idna +net/http/internal +blitiri.com.ar/go/chasquid/internal/envelope +golang.org/x/text/unicode/bidi +golang.org/x/text/unicode/norm +golang.org/x/text/internal/language vendor/golang.org/x/crypto/cryptobyte -google.golang.org/protobuf/encoding/prototext -google.golang.org/protobuf/internal/filedesc -golang.org/x/text/cases -crypto/ecdsa -blitiri.com.ar/go/chasquid/internal/protoio -golang.org/x/text/secure/precis google.golang.org/protobuf/internal/encoding/tag google.golang.org/protobuf/internal/impl -blitiri.com.ar/go/chasquid/internal/normalize +crypto/x509/pkix +crypto/ecdsa +golang.org/x/text/secure/bidirule +blitiri.com.ar/go/chasquid/internal/tlsconst +internal/profile +runtime/trace +runtime/pprof +runtime/debug +golang.org/x/text/internal/language/compact +golang.org/x/text/language +golang.org/x/term +golang.org/x/net/idna log/syslog -blitiri.com.ar/go/chasquid/internal/haproxy -vendor/golang.org/x/net/http/httpproxy +blitiri.com.ar/go/log +crypto/x509 net/textproto +vendor/golang.org/x/net/http/httpproxy +blitiri.com.ar/go/chasquid/internal/haproxy +golang.org/x/text/internal blitiri.com.ar/go/spf blitiri.com.ar/go/systemd -crypto/x509 -blitiri.com.ar/go/log vendor/golang.org/x/net/http/httpguts +golang.org/x/text/cases mime/multipart blitiri.com.ar/go/chasquid/internal/dovecot -blitiri.com.ar/go/chasquid/cmd/mda-lmtp net/mail +blitiri.com.ar/go/chasquid/cmd/mda-lmtp +testing +golang.org/x/text/secure/precis crypto/tls +blitiri.com.ar/go/chasquid/internal/normalize google.golang.org/protobuf/internal/filetype google.golang.org/protobuf/runtime/protoimpl -blitiri.com.ar/go/chasquid/internal/protoio/testpb -blitiri.com.ar/go/chasquid/internal/userdb blitiri.com.ar/go/chasquid/internal/config +blitiri.com.ar/go/chasquid/internal/userdb +blitiri.com.ar/go/chasquid/internal/protoio/testpb net/http/httptrace -blitiri.com.ar/go/chasquid/internal/testlib net/smtp +blitiri.com.ar/go/chasquid/internal/testlib net/http blitiri.com.ar/go/chasquid/internal/smtp -expvar golang.org/x/net/context/ctxhttp -net/http/pprof +expvar blitiri.com.ar/go/chasquid/internal/nettrace +net/http/pprof blitiri.com.ar/go/chasquid/internal/expvarom blitiri.com.ar/go/chasquid/internal/trace blitiri.com.ar/go/chasquid/internal/maillog -blitiri.com.ar/go/chasquid/internal/domaininfo -blitiri.com.ar/go/chasquid/internal/auth blitiri.com.ar/go/chasquid/internal/sts +blitiri.com.ar/go/chasquid/internal/domaininfo blitiri.com.ar/go/chasquid/internal/aliases +blitiri.com.ar/go/chasquid/internal/auth blitiri.com.ar/go/chasquid/cmd/chasquid-util blitiri.com.ar/go/chasquid/cmd/smtp-check blitiri.com.ar/go/chasquid/internal/courier @@ -708,7 +751,7 @@ blitiri.com.ar/go/chasquid make[1]: Leaving directory '/build/chasquid-1.11' dh_auto_test -O--buildsystem=golang - cd obj-i686-linux-gnu && go test -vet=off -v -p 16 blitiri.com.ar/go/chasquid blitiri.com.ar/go/chasquid/cmd/chasquid-util blitiri.com.ar/go/chasquid/cmd/mda-lmtp blitiri.com.ar/go/chasquid/cmd/smtp-check blitiri.com.ar/go/chasquid/internal/aliases blitiri.com.ar/go/chasquid/internal/auth blitiri.com.ar/go/chasquid/internal/config blitiri.com.ar/go/chasquid/internal/courier blitiri.com.ar/go/chasquid/internal/domaininfo blitiri.com.ar/go/chasquid/internal/dovecot blitiri.com.ar/go/chasquid/internal/envelope blitiri.com.ar/go/chasquid/internal/expvarom blitiri.com.ar/go/chasquid/internal/haproxy blitiri.com.ar/go/chasquid/internal/maillog blitiri.com.ar/go/chasquid/internal/nettrace blitiri.com.ar/go/chasquid/internal/normalize blitiri.com.ar/go/chasquid/internal/protoio blitiri.com.ar/go/chasquid/internal/protoio/testpb blitiri.com.ar/go/chasquid/internal/queue blitiri.com.ar/go/chasquid/internal/safeio blitiri.com.ar/go/chasquid/internal/set blitiri.com.ar/go/chasquid/internal/smtp blitiri.com.ar/go/chasquid/internal/smtpsrv blitiri.com.ar/go/chasquid/internal/sts blitiri.com.ar/go/chasquid/internal/testlib blitiri.com.ar/go/chasquid/internal/tlsconst blitiri.com.ar/go/chasquid/internal/trace blitiri.com.ar/go/chasquid/internal/userdb + cd obj-i686-linux-gnu && go test -vet=off -v -p 7 blitiri.com.ar/go/chasquid blitiri.com.ar/go/chasquid/cmd/chasquid-util blitiri.com.ar/go/chasquid/cmd/mda-lmtp blitiri.com.ar/go/chasquid/cmd/smtp-check blitiri.com.ar/go/chasquid/internal/aliases blitiri.com.ar/go/chasquid/internal/auth blitiri.com.ar/go/chasquid/internal/config blitiri.com.ar/go/chasquid/internal/courier blitiri.com.ar/go/chasquid/internal/domaininfo blitiri.com.ar/go/chasquid/internal/dovecot blitiri.com.ar/go/chasquid/internal/envelope blitiri.com.ar/go/chasquid/internal/expvarom blitiri.com.ar/go/chasquid/internal/haproxy blitiri.com.ar/go/chasquid/internal/maillog blitiri.com.ar/go/chasquid/internal/nettrace blitiri.com.ar/go/chasquid/internal/normalize blitiri.com.ar/go/chasquid/internal/protoio blitiri.com.ar/go/chasquid/internal/protoio/testpb blitiri.com.ar/go/chasquid/internal/queue blitiri.com.ar/go/chasquid/internal/safeio blitiri.com.ar/go/chasquid/internal/set blitiri.com.ar/go/chasquid/internal/smtp blitiri.com.ar/go/chasquid/internal/smtpsrv blitiri.com.ar/go/chasquid/internal/sts blitiri.com.ar/go/chasquid/internal/testlib blitiri.com.ar/go/chasquid/internal/tlsconst blitiri.com.ar/go/chasquid/internal/trace blitiri.com.ar/go/chasquid/internal/userdb ? blitiri.com.ar/go/chasquid [no test files] ? blitiri.com.ar/go/chasquid/cmd/chasquid-util [no test files] ? blitiri.com.ar/go/chasquid/cmd/mda-lmtp [no test files] @@ -732,12 +775,12 @@ === RUN TestRichFile --- PASS: TestRichFile (0.00s) === RUN TestManyFiles ---- PASS: TestManyFiles (0.00s) +--- PASS: TestManyFiles (0.02s) === RUN TestHookError _ aliases.go:501 Hook.Alias-Resolve a@localA: error: exit status 1 _ aliases.go:501 Hook.Alias-Resolve *@localA: error: exit status 1 _ aliases.go:501 Hook.Alias-Resolve a@localA: error: exit status 1 ---- PASS: TestHookError (0.00s) +--- PASS: TestHookError (0.05s) === RUN FuzzReader === RUN FuzzReader/1c24d2215db69748c6fd16797673ad11ebc7e6167fe1bc1f54c6959ec10407b6 === RUN FuzzReader/4adaceaa32e2b32c00322948769d62c2dd42e1d9f4950d3c5b411c710e6d4a86 @@ -751,7 +794,7 @@ --- PASS: FuzzReader/c9c80ba9f513841cb081fe9bb7439d36f9f7a06bb999d4c39441991ccc878a9e (0.00s) --- PASS: FuzzReader/d40a98862ed393eb712e47a91bcef18e6f24cf368bb4bd248c7a7101ef8e178d (0.00s) PASS -ok blitiri.com.ar/go/chasquid/internal/aliases 0.028s +ok blitiri.com.ar/go/chasquid/internal/aliases 0.174s === RUN TestDecodeResponse auth_test.go:56: OK: "" failed with response pieces != 3, as per RFC auth_test.go:56: OK: "\x00" failed with response pieces != 3, as per RFC @@ -764,11 +807,11 @@ auth_test.go:56: OK: "\xffa@b\x00\xffa@b\x00pass" failed with bidirule: failed Bidi Rule --- PASS: TestDecodeResponse (0.00s) === RUN TestAuthenticate ---- PASS: TestAuthenticate (0.83s) +--- PASS: TestAuthenticate (0.77s) === RUN TestInterfaces --- PASS: TestInterfaces (0.00s) === RUN TestMultipleBackends ---- PASS: TestMultipleBackends (0.18s) +--- PASS: TestMultipleBackends (0.20s) === RUN TestErrors --- PASS: TestErrors (0.00s) === RUN TestReload @@ -797,28 +840,28 @@ --- PASS: FuzzDecodeResponse/d9aa9c617d1f5b3021aca758b9d896d136e3b16ed53233d02abffd02aa73ffa4 (0.00s) --- PASS: FuzzDecodeResponse/de05c7993312bab83e8114e9d9ced331c49822dc55c1a353f1cc9718a28226e7 (0.00s) PASS -ok blitiri.com.ar/go/chasquid/internal/auth 1.037s +ok blitiri.com.ar/go/chasquid/internal/auth 1.157s === RUN TestEmptyStruct --- PASS: TestEmptyStruct (0.00s) === RUN TestEmptyConfig - testlib.go:32: test directory: "/tmp/testlib_43158490" + testlib.go:32: test directory: "/tmp/testlib_3455945882" --- PASS: TestEmptyConfig (0.00s) === RUN TestFullConfig - testlib.go:32: test directory: "/tmp/testlib_702908384" + testlib.go:32: test directory: "/tmp/testlib_2675245190" --- PASS: TestFullConfig (0.00s) === RUN TestErrorLoading --- PASS: TestErrorLoading (0.00s) === RUN TestBrokenConfig - testlib.go:32: test directory: "/tmp/testlib_2830302746" + testlib.go:32: test directory: "/tmp/testlib_937078731" --- PASS: TestBrokenConfig (0.00s) === RUN TestBrokenOverride - testlib.go:32: test directory: "/tmp/testlib_4128310005" + testlib.go:32: test directory: "/tmp/testlib_6303334" --- PASS: TestBrokenOverride (0.00s) PASS -ok blitiri.com.ar/go/chasquid/internal/config 0.006s +ok blitiri.com.ar/go/chasquid/internal/config 0.013s === RUN TestMDA - testlib.go:32: test directory: "/tmp/testlib_1525660037" ---- PASS: TestMDA (0.00s) + testlib.go:32: test directory: "/tmp/testlib_2155005063" +--- PASS: TestMDA (0.01s) === RUN TestMDATimeout _ mda.go:67 Courier.MDA to@local: error: operation timed out --- PASS: TestMDATimeout (0.10s) @@ -832,10 +875,10 @@ === RUN TestSanitize --- PASS: TestSanitize (0.00s) === RUN TestSMTP - testlib.go:32: test directory: "/tmp/testlib_3639398084" - testlib.go:32: test directory: "/tmp/testlib_1043743110" -_ smtp.go:125 Courier.SMTP to@to: error: Could not dial: dial tcp: address ::::43761: too many colons in address -_ smtp.go:101 Courier.SMTP to@to: error: \":::\" returned transient error: Could not dial: dial tcp: address ::::43761: too many colons in address + testlib.go:32: test directory: "/tmp/testlib_3726031221" + testlib.go:32: test directory: "/tmp/testlib_3851275123" +_ smtp.go:125 Courier.SMTP to@to: error: Could not dial: dial tcp: address ::::39093: too many colons in address +_ smtp.go:101 Courier.SMTP to@to: error: \":::\" returned transient error: Could not dial: dial tcp: address ::::39093: too many colons in address fakeserver_test.go:97: fakeServer got connection fakeserver_test.go:108: fakeServer read: "EHLO hello" fakeserver_test.go:108: fakeServer read: "MAIL FROM:" @@ -843,26 +886,26 @@ fakeserver_test.go:108: fakeServer read: "DATA" fakeserver_test.go:108: fakeServer read: "QUIT" fakeserver_test.go:104: fakeServer exiting: EOF ---- PASS: TestSMTP (0.14s) +--- PASS: TestSMTP (0.22s) === RUN TestSMTPErrors - testlib.go:32: test directory: "/tmp/testlib_2655029315" - testlib.go:32: test directory: "/tmp/testlib_3569032016" + testlib.go:32: test directory: "/tmp/testlib_4161457504" + testlib.go:32: test directory: "/tmp/testlib_2664146793" fakeserver_test.go:97: fakeServer got connection -_ smtp.go:136 Courier.SMTP to@to: error: Error saying hello: write tcp 127.0.0.1:56568->127.0.0.1:46203: i/o timeout -_ smtp.go:101 Courier.SMTP to@to: error: \"127.0.0.1\" returned transient error: Error saying hello: write tcp 127.0.0.1:56568->127.0.0.1:46203: i/o timeout -_ smtp.go:105 Courier.SMTP to@to: error: all MXs returned transient failures (last: Error saying hello: write tcp 127.0.0.1:56568->127.0.0.1:46203: i/o timeout) +_ smtp.go:136 Courier.SMTP to@to: error: Error saying hello: write tcp 127.0.0.1:42070->127.0.0.1:44733: i/o timeout +_ smtp.go:101 Courier.SMTP to@to: error: \"127.0.0.1\" returned transient error: Error saying hello: write tcp 127.0.0.1:42070->127.0.0.1:44733: i/o timeout +_ smtp.go:105 Courier.SMTP to@to: error: all MXs returned transient failures (last: Error saying hello: write tcp 127.0.0.1:42070->127.0.0.1:44733: i/o timeout) + smtp_test.go:140: failed as expected: all MXs returned transient failures (last: Error saying hello: write tcp 127.0.0.1:42070->127.0.0.1:44733: i/o timeout) fakeserver_test.go:104: fakeServer exiting: EOF - smtp_test.go:140: failed as expected: all MXs returned transient failures (last: Error saying hello: write tcp 127.0.0.1:56568->127.0.0.1:46203: i/o timeout) - testlib.go:32: test directory: "/tmp/testlib_3060463633" - testlib.go:32: test directory: "/tmp/testlib_722938954" + testlib.go:32: test directory: "/tmp/testlib_2617663879" + testlib.go:32: test directory: "/tmp/testlib_1454988876" fakeserver_test.go:97: fakeServer got connection fakeserver_test.go:108: fakeServer read: "EHLO hello" fakeserver_test.go:108: fakeServer read: "MAIL FROM:" _ smtp.go:187 Courier.SMTP to@to: error: MAIL+RCPT 501 mail error smtp_test.go:140: failed as expected: MAIL+RCPT 501 mail error fakeserver_test.go:104: fakeServer exiting: EOF - testlib.go:32: test directory: "/tmp/testlib_3987230392" - testlib.go:32: test directory: "/tmp/testlib_1275616584" + testlib.go:32: test directory: "/tmp/testlib_3701936065" + testlib.go:32: test directory: "/tmp/testlib_1624239072" fakeserver_test.go:97: fakeServer got connection fakeserver_test.go:108: fakeServer read: "EHLO hello" fakeserver_test.go:108: fakeServer read: "MAIL FROM:" @@ -870,8 +913,8 @@ _ smtp.go:187 Courier.SMTP to@to: error: MAIL+RCPT 501 rcpt error smtp_test.go:140: failed as expected: MAIL+RCPT 501 rcpt error fakeserver_test.go:104: fakeServer exiting: EOF - testlib.go:32: test directory: "/tmp/testlib_1611852335" - testlib.go:32: test directory: "/tmp/testlib_1631897526" + testlib.go:32: test directory: "/tmp/testlib_3788496884" + testlib.go:32: test directory: "/tmp/testlib_1901331810" fakeserver_test.go:97: fakeServer got connection fakeserver_test.go:108: fakeServer read: "EHLO hello" fakeserver_test.go:108: fakeServer read: "MAIL FROM:" @@ -880,8 +923,8 @@ _ smtp.go:192 Courier.SMTP to@to: error: DATA 554 data error smtp_test.go:140: failed as expected: DATA 554 data error fakeserver_test.go:131: fakeServer exiting: unexpected EOF - testlib.go:32: test directory: "/tmp/testlib_1684811375" - testlib.go:32: test directory: "/tmp/testlib_545094962" + testlib.go:32: test directory: "/tmp/testlib_4248960865" + testlib.go:32: test directory: "/tmp/testlib_3936062454" fakeserver_test.go:97: fakeServer got connection fakeserver_test.go:108: fakeServer read: "EHLO hello" fakeserver_test.go:108: fakeServer read: "MAIL FROM:" @@ -890,9 +933,9 @@ _ smtp.go:201 Courier.SMTP to@to: error: DATA closing 551 data response error smtp_test.go:140: failed as expected: DATA closing 551 data response error fakeserver_test.go:104: fakeServer exiting: EOF ---- PASS: TestSMTPErrors (1.48s) +--- PASS: TestSMTPErrors (2.00s) === RUN TestNoMXServer - testlib.go:32: test directory: "/tmp/testlib_3301394070" + testlib.go:32: test directory: "/tmp/testlib_3497150104" _ smtp.go:82 Courier.SMTP to@to: error: Could not find mail server: smtp_test.go:158: got permanent failure, as expected: Could not find mail server: --- PASS: TestNoMXServer (0.00s) @@ -907,8 +950,8 @@ === RUN TestLookupInvalidDomain --- PASS: TestLookupInvalidDomain (0.00s) === RUN TestTLS - testlib.go:32: test directory: "/tmp/testlib_604102631" - testlib.go:32: test directory: "/tmp/testlib_3463085851" + testlib.go:32: test directory: "/tmp/testlib_1909985796" + testlib.go:32: test directory: "/tmp/testlib_4206240652" fakeserver_test.go:97: fakeServer got connection fakeserver_test.go:108: fakeServer read: "EHLO hello" fakeserver_test.go:108: fakeServer read: "STARTTLS" @@ -919,7 +962,7 @@ fakeserver_test.go:108: fakeServer read: "DATA" fakeserver_test.go:108: fakeServer read: "QUIT" fakeserver_test.go:104: fakeServer exiting: EOF - testlib.go:32: test directory: "/tmp/testlib_2263450726" + testlib.go:32: test directory: "/tmp/testlib_3532172518" fakeserver_test.go:97: fakeServer got connection fakeserver_test.go:108: fakeServer read: "EHLO hello" _ domaininfo.go:144 DomainInfo.Outgoing to: error: to outgoing denied: PLAIN < TLS_INSECURE @@ -927,10 +970,10 @@ _ smtp.go:101 Courier.SMTP to@to: error: \"localhost\" returned transient error: Security level check failed (level:PLAIN) _ smtp.go:105 Courier.SMTP to@to: error: all MXs returned transient failures (last: Security level check failed (level:PLAIN)) fakeserver_test.go:104: fakeServer exiting: EOF ---- PASS: TestTLS (0.29s) +--- PASS: TestTLS (1.03s) === RUN TestTLSError - testlib.go:32: test directory: "/tmp/testlib_2701901486" - testlib.go:32: test directory: "/tmp/testlib_2272180943" + testlib.go:32: test directory: "/tmp/testlib_3829237300" + testlib.go:32: test directory: "/tmp/testlib_2498167514" fakeserver_test.go:97: fakeServer got connection fakeserver_test.go:108: fakeServer read: "EHLO hello" fakeserver_test.go:108: fakeServer read: "STARTTLS" @@ -938,10 +981,10 @@ _ smtp.go:101 Courier.SMTP to@to: error: \"localhost\" returned transient error: TLS error: 500 starttls err _ smtp.go:105 Courier.SMTP to@to: error: all MXs returned transient failures (last: TLS error: 500 starttls err) fakeserver_test.go:104: fakeServer exiting: EOF ---- PASS: TestTLSError (0.04s) +--- PASS: TestTLSError (0.34s) === RUN TestSTSPolicyEnforcement - testlib.go:32: test directory: "/tmp/testlib_2937278957" - testlib.go:32: test directory: "/tmp/testlib_985885181" + testlib.go:32: test directory: "/tmp/testlib_4040316874" + testlib.go:32: test directory: "/tmp/testlib_3277656155" fakeserver_test.go:97: fakeServer got connection fakeserver_test.go:108: fakeServer read: "EHLO hello" fakeserver_test.go:108: fakeServer read: "STARTTLS" @@ -949,7 +992,7 @@ _ domaininfo.go:152 DomainInfo.Outgoing to: to outgoing level raised: TLS_INSECURE > PLAIN _ smtp.go:179 test test: error: invalid security level (TLS_INSECURE) for STS policy fakeserver_test.go:104: fakeServer exiting: EOF - testlib.go:32: test directory: "/tmp/testlib_4292541821" + testlib.go:32: test directory: "/tmp/testlib_1148079888" fakeserver_test.go:97: fakeServer got connection fakeserver_test.go:108: fakeServer read: "EHLO hello" fakeserver_test.go:108: fakeServer read: "STARTTLS" @@ -960,24 +1003,24 @@ fakeserver_test.go:108: fakeServer read: "DATA" fakeserver_test.go:108: fakeServer read: "QUIT" fakeserver_test.go:104: fakeServer exiting: EOF ---- PASS: TestSTSPolicyEnforcement (0.25s) +--- PASS: TestSTSPolicyEnforcement (0.94s) PASS -ok blitiri.com.ar/go/chasquid/internal/courier 2.323s +ok blitiri.com.ar/go/chasquid/internal/courier 4.697s === RUN TestBasic - testlib.go:32: test directory: "/tmp/testlib_1971371341" + testlib.go:32: test directory: "/tmp/testlib_1798788992" _ domaininfo.go:116 DomainInfo.Incoming d1: d1 incoming level raised: TLS_SECURE > PLAIN _ domaininfo.go:108 DomainInfo.Incoming d1: error: d1 incoming denied: TLS_INSECURE < TLS_SECURE _ domaininfo.go:108 DomainInfo.Incoming d1: error: d1 incoming denied: TLS_INSECURE < TLS_SECURE --- PASS: TestBasic (0.00s) === RUN TestNewDomain - testlib.go:32: test directory: "/tmp/testlib_4172311069" + testlib.go:32: test directory: "/tmp/testlib_2410476403" _ domaininfo.go:116 DomainInfo.Incoming insecure: insecure incoming level raised: TLS_INSECURE > PLAIN _ domaininfo.go:152 DomainInfo.Outgoing insecure: insecure outgoing level raised: TLS_INSECURE > PLAIN _ domaininfo.go:116 DomainInfo.Incoming secure: secure incoming level raised: TLS_SECURE > PLAIN _ domaininfo.go:152 DomainInfo.Outgoing secure: secure outgoing level raised: TLS_SECURE > PLAIN --- PASS: TestNewDomain (0.00s) === RUN TestProgressions - testlib.go:32: test directory: "/tmp/testlib_1215102644" + testlib.go:32: test directory: "/tmp/testlib_1387142523" _ domaininfo.go:116 DomainInfo.Incoming pisis: pisis incoming level raised: TLS_INSECURE > PLAIN _ domaininfo.go:152 DomainInfo.Outgoing pisis: pisis outgoing level raised: TLS_INSECURE > PLAIN _ domaininfo.go:116 DomainInfo.Incoming pisis: pisis incoming level raised: TLS_SECURE > TLS_INSECURE @@ -992,21 +1035,21 @@ _ domaininfo.go:144 DomainInfo.Outgoing ssip: error: ssip outgoing denied: PLAIN < TLS_SECURE --- PASS: TestProgressions (0.00s) === RUN TestErrors - testlib.go:32: test directory: "/tmp/testlib_2960242234" + testlib.go:32: test directory: "/tmp/testlib_3176871025" _ domaininfo.go:116 DomainInfo.Incoming d1: d1 incoming level raised: TLS_SECURE > PLAIN _ domaininfo.go:67 DomainInfo.Reload reload: error: id \"d1\": proto:\u00a0syntax error (line 1:1): invalid field name: invalid-text-protobuf-contents --- PASS: TestErrors (0.00s) PASS -ok blitiri.com.ar/go/chasquid/internal/domaininfo 0.022s +ok blitiri.com.ar/go/chasquid/internal/domaininfo 0.033s === RUN TestUsernameNotSafe --- PASS: TestUsernameNotSafe (0.00s) === RUN TestAutodetect - testlib.go:32: test directory: "/tmp/testlib_162357227" + testlib.go:32: test directory: "/tmp/testlib_3474868529" --- PASS: TestAutodetect (0.00s) === RUN TestReload --- PASS: TestReload (0.00s) PASS -ok blitiri.com.ar/go/chasquid/internal/dovecot 0.004s +ok blitiri.com.ar/go/chasquid/internal/dovecot 0.008s === RUN TestSplit --- PASS: TestSplit (0.00s) === RUN TestDomainIn @@ -1014,13 +1057,13 @@ === RUN TestAddHeader --- PASS: TestAddHeader (0.00s) PASS -ok blitiri.com.ar/go/chasquid/internal/envelope 0.002s +ok blitiri.com.ar/go/chasquid/internal/envelope 0.045s === RUN TestHandler --- PASS: TestHandler (0.00s) === RUN TestMapLabelAccident --- PASS: TestMapLabelAccident (0.00s) PASS -ok blitiri.com.ar/go/chasquid/internal/expvarom 0.008s +ok blitiri.com.ar/go/chasquid/internal/expvarom 0.016s === RUN TestNoNewline --- PASS: TestNoNewline (0.00s) === RUN TestBasic @@ -1045,7 +1088,7 @@ haproxy_test.go:69: testing 18: PROXY TCP6 5::5 6::6 7777 8888 --- PASS: TestBasic (0.00s) PASS -ok blitiri.com.ar/go/chasquid/internal/haproxy 0.003s +ok blitiri.com.ar/go/chasquid/internal/haproxy 0.008s === RUN TestLogger --- PASS: TestLogger (0.00s) === RUN TestDefault @@ -1053,7 +1096,7 @@ === RUN TestFailedLogger --- PASS: TestFailedLogger (0.00s) PASS -ok blitiri.com.ar/go/chasquid/internal/maillog 0.019s +ok blitiri.com.ar/go/chasquid/internal/maillog 0.057s === RUN TestContext --- PASS: TestContext (0.00s) === RUN TestHistogramBasic @@ -1061,15 +1104,15 @@ === RUN TestHistogramEmpty --- PASS: TestHistogramEmpty (0.00s) === RUN TestHTTP ---- PASS: TestHTTP (0.01s) +--- PASS: TestHTTP (0.02s) === RUN TestHTTPLong ---- PASS: TestHTTPLong (0.00s) +--- PASS: TestHTTPLong (0.01s) === RUN TestHTTPErrors ---- PASS: TestHTTPErrors (0.01s) +--- PASS: TestHTTPErrors (0.02s) === RUN TestHTTPUroboro ---- PASS: TestHTTPUroboro (0.01s) +--- PASS: TestHTTPUroboro (0.05s) === RUN TestHTTPDeep ---- PASS: TestHTTPDeep (0.00s) +--- PASS: TestHTTPDeep (0.02s) === RUN TestStripZeros --- PASS: TestStripZeros (0.00s) === RUN TestRegisterHandler @@ -1089,7 +1132,7 @@ === RUN TestFindParent --- PASS: TestFindParent (0.00s) PASS -ok blitiri.com.ar/go/chasquid/internal/nettrace 0.057s +ok blitiri.com.ar/go/chasquid/internal/nettrace 0.202s === RUN TestUser --- PASS: TestUser (0.00s) === RUN TestDomain @@ -1147,41 +1190,41 @@ --- PASS: FuzzDomainToUnicode/d8637022b61fb5c4df4e153063564accd6331debaafdd594405c320a5e9f2e70 (0.00s) --- PASS: FuzzDomainToUnicode/dc0204d8e2ab058a763873d2a5fede806e95235771ecdd96b56c906886822c19 (0.00s) PASS -ok blitiri.com.ar/go/chasquid/internal/normalize 0.004s +ok blitiri.com.ar/go/chasquid/internal/normalize 0.006s === RUN TestBin - testlib.go:32: test directory: "/tmp/testlib_628722760" + testlib.go:32: test directory: "/tmp/testlib_926116427" --- PASS: TestBin (0.00s) === RUN TestText - testlib.go:32: test directory: "/tmp/testlib_3263557916" + testlib.go:32: test directory: "/tmp/testlib_2951796792" --- PASS: TestText (0.00s) === RUN TestStore - testlib.go:32: test directory: "/tmp/testlib_1337431332" + testlib.go:32: test directory: "/tmp/testlib_3170907172" --- PASS: TestStore (0.00s) === RUN TestFileErrors - testlib.go:32: test directory: "/tmp/testlib_2393878607" + testlib.go:32: test directory: "/tmp/testlib_3580813441" --- PASS: TestFileErrors (0.00s) === RUN TestMarshalErrors - testlib.go:32: test directory: "/tmp/testlib_770192838" + testlib.go:32: test directory: "/tmp/testlib_3966339115" --- PASS: TestMarshalErrors (0.00s) PASS -ok blitiri.com.ar/go/chasquid/internal/protoio 0.005s +ok blitiri.com.ar/go/chasquid/internal/protoio 0.009s ? blitiri.com.ar/go/chasquid/internal/protoio/testpb [no test files] === RUN TestDSN dsn_test.go:49: From: Mail Delivery System To: Subject: Mail delivery failed: returning message to sender - Message-ID: - Date: Wed, 22 May 2024 08:37:18 -1200 + Message-ID: + Date: Fri, 21 Apr 2023 04:15:48 +1400 In-Reply-To: References: X-Failed-Recipients: pepe@africa.org, ñaca@africa.org, Auto-Submitted: auto-replied MIME-Version: 1.0 Content-Type: multipart/report; report-type=delivery-status; - boundary="fhVrbPDLLMo" + boundary="esoedFONkos" - --fhVrbPDLLMo + --esoedFONkos Content-Type: text/plain; charset="utf-8" Content-Disposition: inline Content-Description: Notification @@ -1206,7 +1249,7 @@ oh! the humanity! - --fhVrbPDLLMo + --esoedFONkos Content-Type: message/global-delivery-status Content-Description: Delivery Report Content-Transfer-Encoding: 8bit @@ -1237,7 +1280,7 @@ - --fhVrbPDLLMo + --esoedFONkos Content-Type: message/rfc822 Content-Description: Undelivered Message Content-Transfer-Encoding: 8bit @@ -1247,75 +1290,74 @@ Data ñaca. - --fhVrbPDLLMo-- + --esoedFONkos-- --- PASS: TestDSN (0.00s) === RUN TestBasic - testlib.go:32: test directory: "/tmp/testlib_4167304314" -_ queue.go:308 Queue.SendLoop r7u_sItXAY8: from from -_ queue.go:367 Queue.SendLoop r7u_sItXAY8: nodomain sent -_ queue.go:367 Queue.SendLoop r7u_sItXAY8: x@remote sent -_ queue.go:367 Queue.SendLoop r7u_sItXAY8: am@loco sent -_ queue.go:342 Queue.SendLoop r7u_sItXAY8: all done + testlib.go:32: test directory: "/tmp/testlib_3483236649" +_ queue.go:308 Queue.SendLoop Dmt7cIQC03E: from from +_ queue.go:367 Queue.SendLoop Dmt7cIQC03E: nodomain sent +_ queue.go:367 Queue.SendLoop Dmt7cIQC03E: x@remote sent +_ queue.go:367 Queue.SendLoop Dmt7cIQC03E: am@loco sent +_ queue.go:342 Queue.SendLoop Dmt7cIQC03E: all done --- PASS: TestBasic (0.02s) === RUN TestDSNOnTimeout - testlib.go:32: test directory: "/tmp/testlib_2332328662" -_ queue.go:308 Queue.SendLoop 3Mg5RcP5qKg: from from@loco -_ queue.go:465 Queue.SendLoop 3Mg5RcP5qKg: queued DSN: Lwr6-11jhX0 -_ queue.go:342 Queue.SendLoop 3Mg5RcP5qKg: all done -_ queue.go:308 Queue.SendLoop Lwr6-11jhX0: from <> -_ queue.go:367 Queue.SendLoop Lwr6-11jhX0: from@loco sent -_ queue.go:342 Queue.SendLoop Lwr6-11jhX0: all done -E queue.go:230 failed to remove queue file "/tmp/testlib_2332328662/m:Lwr6-11jhX0": remove /tmp/testlib_2332328662/m:Lwr6-11jhX0: no such file or directory + testlib.go:32: test directory: "/tmp/testlib_1377052345" +_ queue.go:308 Queue.SendLoop WP40qBFUxnc: from from@loco +_ queue.go:465 Queue.SendLoop WP40qBFUxnc: queued DSN: uD4cd8gKzXI +_ queue.go:342 Queue.SendLoop WP40qBFUxnc: all done +_ queue.go:308 Queue.SendLoop uD4cd8gKzXI: from <> +_ queue.go:367 Queue.SendLoop uD4cd8gKzXI: from@loco sent +_ queue.go:342 Queue.SendLoop uD4cd8gKzXI: all done --- PASS: TestDSNOnTimeout (0.00s) === RUN TestAliases - testlib.go:32: test directory: "/tmp/testlib_1430850467" -_ queue.go:308 Queue.SendLoop v8etG4PUd4A: from from -_ queue.go:367 Queue.SendLoop v8etG4PUd4A: ata@hualpa sent + testlib.go:32: test directory: "/tmp/testlib_4190864352" +_ queue.go:308 Queue.SendLoop C_A89GtESiU: from from +_ queue.go:367 Queue.SendLoop C_A89GtESiU: ata@hualpa sent +_ queue.go:367 Queue.SendLoop C_A89GtESiU: pq@loco sent +_ queue.go:367 Queue.SendLoop C_A89GtESiU: rs@loco sent +_ queue.go:342 Queue.SendLoop C_A89GtESiU: all done --- PASS: TestAliases (0.00s) === RUN TestFullQueue -_ queue.go:367 Queue.SendLoop v8etG4PUd4A: pq@loco sent - testlib.go:32: test directory: "/tmp/testlib_454430278" -_ queue.go:367 Queue.SendLoop v8etG4PUd4A: rs@loco sent + testlib.go:32: test directory: "/tmp/testlib_3762981590" _ queue.go:164 Queue.Put from: error: queue full --- PASS: TestFullQueue (0.00s) === RUN TestPipes -_ queue.go:308 Queue.SendLoop HzbtOcocRyo: from from -_ queue.go:367 Queue.SendLoop HzbtOcocRyo: to sent - testlib.go:32: test directory: "/tmp/testlib_495842927" -_ queue.go:375 Queue.SendLoop HzbtOcocRyo: error: failed to write: open /tmp/testlib_454430278/.m:HzbtOcocRyo1446766652: no such file or directory -_ queue.go:342 Queue.SendLoop HzbtOcocRyo: all done -_ queue.go:342 Queue.SendLoop v8etG4PUd4A: all done -E queue.go:230 failed to remove queue file "/tmp/testlib_454430278/m:HzbtOcocRyo": remove /tmp/testlib_454430278/m:HzbtOcocRyo: no such file or directory + testlib.go:32: test directory: "/tmp/testlib_1546271734" +_ queue.go:308 Queue.SendLoop IE3OOOzhTyQ: from from +_ queue.go:367 Queue.SendLoop IE3OOOzhTyQ: to sent +_ queue.go:375 Queue.SendLoop IE3OOOzhTyQ: error: failed to write: open /tmp/testlib_3762981590/.m:IE3OOOzhTyQ326357064: no such file or directory +_ queue.go:342 Queue.SendLoop IE3OOOzhTyQ: all done +E queue.go:230 failed to remove queue file "/tmp/testlib_3762981590/m:IE3OOOzhTyQ": remove /tmp/testlib_3762981590/m:IE3OOOzhTyQ: no such file or directory --- PASS: TestPipes (0.00s) === RUN TestBadPath --- PASS: TestBadPath (0.00s) === RUN TestNextDelay --- PASS: TestNextDelay (0.00s) === RUN TestSerialization - testlib.go:32: test directory: "/tmp/testlib_1170778042" -_ queue.go:308 Queue.SendLoop rq3lbt63fXY: from from@loco -_ queue.go:367 Queue.SendLoop rq3lbt63fXY: to@to sent -_ queue.go:342 Queue.SendLoop rq3lbt63fXY: all done -E queue.go:230 failed to remove queue file "/tmp/testlib_1170778042/m:rq3lbt63fXY": remove /tmp/testlib_1170778042/m:rq3lbt63fXY: no such file or directory + testlib.go:32: test directory: "/tmp/testlib_2531479678" +_ queue.go:308 Queue.SendLoop X1DN5i8lxAo: from from@loco +_ queue.go:367 Queue.SendLoop X1DN5i8lxAo: to@to sent +_ queue.go:342 Queue.SendLoop X1DN5i8lxAo: all done +E queue.go:230 failed to remove queue file "/tmp/testlib_2531479678/m:X1DN5i8lxAo": remove /tmp/testlib_2531479678/m:X1DN5i8lxAo: no such file or directory --- PASS: TestSerialization (0.00s) PASS -ok blitiri.com.ar/go/chasquid/internal/queue 0.044s +ok blitiri.com.ar/go/chasquid/internal/queue 0.092s === RUN TestWriteFile - testlib.go:32: test directory: "/tmp/testlib_3800903502" + testlib.go:32: test directory: "/tmp/testlib_883504988" --- PASS: TestWriteFile (0.00s) === RUN TestWriteFileWithOp - testlib.go:32: test directory: "/tmp/testlib_2185015137" + testlib.go:32: test directory: "/tmp/testlib_3715465462" --- PASS: TestWriteFileWithOp (0.00s) === RUN TestWriteFileWithFailingOp - testlib.go:32: test directory: "/tmp/testlib_3836466507" + testlib.go:32: test directory: "/tmp/testlib_2584662905" --- PASS: TestWriteFileWithFailingOp (0.00s) PASS -ok blitiri.com.ar/go/chasquid/internal/safeio 0.004s +ok blitiri.com.ar/go/chasquid/internal/safeio 0.015s === RUN TestString --- PASS: TestString (0.00s) PASS -ok blitiri.com.ar/go/chasquid/internal/set 0.005s +ok blitiri.com.ar/go/chasquid/internal/set 0.015s === RUN TestIsPermanent --- PASS: TestIsPermanent (0.00s) === RUN TestIsASCII @@ -1329,21 +1371,21 @@ === RUN TestFallbackToIDNA --- PASS: TestFallbackToIDNA (0.00s) === RUN TestLineTooLong ---- PASS: TestLineTooLong (0.02s) +--- PASS: TestLineTooLong (0.04s) PASS -ok blitiri.com.ar/go/chasquid/internal/smtp 0.029s -_ server.go:218 Server listening on 127.0.0.1:43351 (SMTP) -2024-05-22 08:37:19.398593 daemon listening on 127.0.0.1:43351 -_ server.go:218 Server listening on 127.0.0.1:45295 (submission) -2024-05-22 08:37:19.398697 daemon listening on 127.0.0.1:45295 -_ server.go:218 Server listening on 127.0.0.1:37031 (submission+TLS) -2024-05-22 08:37:19.398731 daemon listening on 127.0.0.1:37031 +ok blitiri.com.ar/go/chasquid/internal/smtp 0.047s +_ server.go:218 Server listening on 127.0.0.1:39521 (SMTP) +2023-04-21 04:15:49.152122 daemon listening on 127.0.0.1:39521 +_ server.go:218 Server listening on 127.0.0.1:41207 (submission) +2023-04-21 04:15:49.152314 daemon listening on 127.0.0.1:41207 +_ server.go:218 Server listening on 127.0.0.1:37251 (submission+TLS) +2023-04-21 04:15:49.152367 daemon listening on 127.0.0.1:37251 === RUN TestSecLevel -_ conn.go:189 SMTP.Conn 127.0.0.1:48766: error: error completing TLS handshake: EOF +_ conn.go:189 SMTP.Conn 127.0.0.1:39294: error: error completing TLS handshake: EOF _ domaininfo.go:116 DomainInfo.Incoming slc: slc incoming level raised: TLS_CLIENT > PLAIN _ domaininfo.go:108 DomainInfo.Incoming slc: error: slc incoming denied: PLAIN < TLS_CLIENT _ conn.go:533 testconn testconn: error: security level check for slc failed (PLAIN) ---- PASS: TestSecLevel (0.06s) +--- PASS: TestSecLevel (0.00s) === RUN TestIsHeader --- PASS: TestIsHeader (0.00s) === RUN TestReadUntilDot @@ -1378,223 +1420,223 @@ === RUN TestSanitizeEHLODomain --- PASS: TestSanitizeEHLODomain (0.00s) === RUN TestSimple -_ conn.go:684 SMTP.Conn 127.0.0.1:57788: Queued from from@from to [to@localhost] - k6sV6NdRFJE -2024-05-22 08:37:19.560490 k6sV6NdRFJE from=from@from queued ip=127.0.0.1:57788 to=[to@localhost] -_ queue.go:308 Queue.SendLoop k6sV6NdRFJE: from from@from -_ queue.go:367 Queue.SendLoop k6sV6NdRFJE: testuser@localhost sent -2024-05-22 08:37:19.560625 k6sV6NdRFJE from=from@from to=testuser@localhost sent +_ conn.go:684 SMTP.Conn 127.0.0.1:48882: Queued from from@from to [to@localhost] - _59ppO9rH5I +2023-04-21 04:15:49.262603 _59ppO9rH5I from=from@from queued ip=127.0.0.1:48882 to=[to@localhost] +_ queue.go:308 Queue.SendLoop _59ppO9rH5I: from from@from +_ queue.go:367 Queue.SendLoop _59ppO9rH5I: testuser@localhost sent +2023-04-21 04:15:49.262790 _59ppO9rH5I from=from@from to=testuser@localhost sent --- PASS: TestSimple (0.00s) === RUN TestSimpleTLS -_ queue.go:342 Queue.SendLoop k6sV6NdRFJE: all done -2024-05-22 08:37:19.560858 k6sV6NdRFJE from=from@from all done -_ conn.go:684 SMTP.Conn 127.0.0.1:57802: Queued from from@from to [to@localhost] - BBmYx1kO86Y -2024-05-22 08:37:19.567945 BBmYx1kO86Y from=from@from queued ip=127.0.0.1:57802 to=[to@localhost] -_ queue.go:308 Queue.SendLoop BBmYx1kO86Y: from from@from -_ queue.go:367 Queue.SendLoop BBmYx1kO86Y: testuser@localhost sent -2024-05-22 08:37:19.568056 BBmYx1kO86Y from=from@from to=testuser@localhost sent ---- PASS: TestSimpleTLS (0.01s) -_ queue.go:342 Queue.SendLoop BBmYx1kO86Y: all done +_ queue.go:342 Queue.SendLoop _59ppO9rH5I: all done +2023-04-21 04:15:49.263048 _59ppO9rH5I from=from@from all done +_ conn.go:684 SMTP.Conn 127.0.0.1:48894: Queued from from@from to [to@localhost] - ACs7YsxZs6U +2023-04-21 04:15:49.279368 ACs7YsxZs6U from=from@from queued ip=127.0.0.1:48894 to=[to@localhost] +_ queue.go:308 Queue.SendLoop ACs7YsxZs6U: from from@from +_ queue.go:367 Queue.SendLoop ACs7YsxZs6U: testuser@localhost sent +2023-04-21 04:15:49.279579 ACs7YsxZs6U from=from@from to=testuser@localhost sent +--- PASS: TestSimpleTLS (0.02s) === RUN TestManyEmails -2024-05-22 08:37:19.568318 BBmYx1kO86Y from=from@from all done -_ conn.go:684 SMTP.Conn 127.0.0.1:57806: Queued from from@from to [to@localhost] - Hd7Qs6pFho0 -2024-05-22 08:37:19.575363 Hd7Qs6pFho0 from=from@from queued ip=127.0.0.1:57806 to=[to@localhost] -_ queue.go:308 Queue.SendLoop Hd7Qs6pFho0: from from@from -_ queue.go:367 Queue.SendLoop Hd7Qs6pFho0: testuser@localhost sent -2024-05-22 08:37:19.575447 Hd7Qs6pFho0 from=from@from to=testuser@localhost sent -_ queue.go:342 Queue.SendLoop Hd7Qs6pFho0: all done -2024-05-22 08:37:19.575629 Hd7Qs6pFho0 from=from@from all done -_ conn.go:684 SMTP.Conn 127.0.0.1:57806: Queued from from@from to [to@localhost] - jRIgKjcveds -2024-05-22 08:37:19.576203 jRIgKjcveds from=from@from queued ip=127.0.0.1:57806 to=[to@localhost] -_ queue.go:308 Queue.SendLoop jRIgKjcveds: from from@from -_ queue.go:367 Queue.SendLoop jRIgKjcveds: testuser@localhost sent -2024-05-22 08:37:19.576288 jRIgKjcveds from=from@from to=testuser@localhost sent -_ queue.go:342 Queue.SendLoop jRIgKjcveds: all done -2024-05-22 08:37:19.576471 jRIgKjcveds from=from@from all done -_ conn.go:684 SMTP.Conn 127.0.0.1:57806: Queued from from@from to [to@localhost] - eQGGWvDay1I -2024-05-22 08:37:19.576979 eQGGWvDay1I from=from@from queued ip=127.0.0.1:57806 to=[to@localhost] -_ queue.go:308 Queue.SendLoop eQGGWvDay1I: from from@from -_ queue.go:367 Queue.SendLoop eQGGWvDay1I: testuser@localhost sent -2024-05-22 08:37:19.577083 eQGGWvDay1I from=from@from to=testuser@localhost sent ---- PASS: TestManyEmails (0.01s) +_ queue.go:342 Queue.SendLoop ACs7YsxZs6U: all done +2023-04-21 04:15:49.279965 ACs7YsxZs6U from=from@from all done +_ conn.go:684 SMTP.Conn 127.0.0.1:48908: Queued from from@from to [to@localhost] - qX2rVqU-fmw +2023-04-21 04:15:49.293130 qX2rVqU-fmw from=from@from queued ip=127.0.0.1:48908 to=[to@localhost] +_ queue.go:308 Queue.SendLoop qX2rVqU-fmw: from from@from +_ queue.go:367 Queue.SendLoop qX2rVqU-fmw: testuser@localhost sent +2023-04-21 04:15:49.293324 qX2rVqU-fmw from=from@from to=testuser@localhost sent +_ queue.go:342 Queue.SendLoop qX2rVqU-fmw: all done +2023-04-21 04:15:49.293675 qX2rVqU-fmw from=from@from all done +_ conn.go:684 SMTP.Conn 127.0.0.1:48908: Queued from from@from to [to@localhost] - mgTWtEQiw8A +2023-04-21 04:15:49.294403 mgTWtEQiw8A from=from@from queued ip=127.0.0.1:48908 to=[to@localhost] +_ queue.go:308 Queue.SendLoop mgTWtEQiw8A: from from@from +_ queue.go:367 Queue.SendLoop mgTWtEQiw8A: testuser@localhost sent +2023-04-21 04:15:49.294581 mgTWtEQiw8A from=from@from to=testuser@localhost sent +_ queue.go:342 Queue.SendLoop mgTWtEQiw8A: all done +2023-04-21 04:15:49.294925 mgTWtEQiw8A from=from@from all done +_ conn.go:684 SMTP.Conn 127.0.0.1:48908: Queued from from@from to [to@localhost] - JRsQWZSkOk4 +2023-04-21 04:15:49.295602 JRsQWZSkOk4 from=from@from queued ip=127.0.0.1:48908 to=[to@localhost] +_ queue.go:308 Queue.SendLoop JRsQWZSkOk4: from from@from +_ queue.go:367 Queue.SendLoop JRsQWZSkOk4: testuser@localhost sent +2023-04-21 04:15:49.295791 JRsQWZSkOk4 from=from@from to=testuser@localhost sent +--- PASS: TestManyEmails (0.02s) === RUN TestAuth -_ queue.go:342 Queue.SendLoop eQGGWvDay1I: all done -2024-05-22 08:37:19.577328 eQGGWvDay1I from=from@from all done -2024-05-22 08:37:19.687927 127.0.0.1:46432 auth succeeded for testuser@localhost -_ conn.go:684 SMTP.Conn 127.0.0.1:46432: Queued from testuser@localhost to [to@localhost] - zAnuGy5qUog -2024-05-22 08:37:19.688856 zAnuGy5qUog from=testuser@localhost queued ip=127.0.0.1:46432 to=[to@localhost] -_ queue.go:308 Queue.SendLoop zAnuGy5qUog: from testuser@localhost -_ queue.go:367 Queue.SendLoop zAnuGy5qUog: testuser@localhost sent -2024-05-22 08:37:19.689037 zAnuGy5qUog from=testuser@localhost to=testuser@localhost sent ---- PASS: TestAuth (0.11s) +_ queue.go:342 Queue.SendLoop JRsQWZSkOk4: all done +2023-04-21 04:15:49.296077 JRsQWZSkOk4 from=from@from all done +2023-04-21 04:15:49.424547 127.0.0.1:39778 auth succeeded for testuser@localhost +_ conn.go:684 SMTP.Conn 127.0.0.1:39778: Queued from testuser@localhost to [to@localhost] - ftB2YRCpleA +2023-04-21 04:15:49.425666 ftB2YRCpleA from=testuser@localhost queued ip=127.0.0.1:39778 to=[to@localhost] +_ queue.go:308 Queue.SendLoop ftB2YRCpleA: from testuser@localhost +_ queue.go:367 Queue.SendLoop ftB2YRCpleA: testuser@localhost sent +2023-04-21 04:15:49.425810 ftB2YRCpleA from=testuser@localhost to=testuser@localhost sent +_ queue.go:342 Queue.SendLoop ftB2YRCpleA: all done +2023-04-21 04:15:49.426100 ftB2YRCpleA from=testuser@localhost all done +--- PASS: TestAuth (0.13s) === RUN TestSubmissionWithoutAuth -_ queue.go:342 Queue.SendLoop zAnuGy5qUog: all done -2024-05-22 08:37:19.689310 zAnuGy5qUog from=testuser@localhost all done -_ conn.go:298 SMTP.Conn 127.0.0.1:46440: error: MAIL failed: 550 5.7.9 Mail to submission port must be authenticated +_ conn.go:298 SMTP.Conn 127.0.0.1:39790: error: MAIL failed: 550 5.7.9 Mail to submission port must be authenticated --- PASS: TestSubmissionWithoutAuth (0.01s) === RUN TestAuthOnTLS -2024-05-22 08:37:19.805558 127.0.0.1:48782 auth succeeded for testuser@localhost -_ conn.go:684 SMTP.Conn 127.0.0.1:48782: Queued from testuser@localhost to [to@localhost] - pcwxpsY62z8 -2024-05-22 08:37:19.806496 pcwxpsY62z8 from=testuser@localhost queued ip=127.0.0.1:48782 to=[to@localhost] -_ queue.go:308 Queue.SendLoop pcwxpsY62z8: from testuser@localhost -_ queue.go:367 Queue.SendLoop pcwxpsY62z8: testuser@localhost sent -2024-05-22 08:37:19.806633 pcwxpsY62z8 from=testuser@localhost to=testuser@localhost sent ---- PASS: TestAuthOnTLS (0.11s) +2023-04-21 04:15:49.564908 127.0.0.1:39304 auth succeeded for testuser@localhost +_ conn.go:684 SMTP.Conn 127.0.0.1:39304: Queued from testuser@localhost to [to@localhost] - Z5lqk3cvvYA +2023-04-21 04:15:49.566096 Z5lqk3cvvYA from=testuser@localhost queued ip=127.0.0.1:39304 to=[to@localhost] +_ queue.go:308 Queue.SendLoop Z5lqk3cvvYA: from testuser@localhost +_ queue.go:367 Queue.SendLoop Z5lqk3cvvYA: testuser@localhost sent +2023-04-21 04:15:49.566316 Z5lqk3cvvYA from=testuser@localhost to=testuser@localhost sent +--- PASS: TestAuthOnTLS (0.13s) === RUN TestAuthOnSMTP -_ queue.go:342 Queue.SendLoop pcwxpsY62z8: all done -2024-05-22 08:37:19.806895 pcwxpsY62z8 from=testuser@localhost all done -2024-05-22 08:37:19.921015 127.0.0.1:57822 auth succeeded for testuser@localhost -_ conn.go:684 SMTP.Conn 127.0.0.1:57822: Queued from testuser@localhost to [to@localhost] - y25BEPT8PiA -2024-05-22 08:37:19.921749 y25BEPT8PiA from=testuser@localhost queued ip=127.0.0.1:57822 to=[to@localhost] -_ queue.go:308 Queue.SendLoop y25BEPT8PiA: from testuser@localhost -_ queue.go:367 Queue.SendLoop y25BEPT8PiA: testuser@localhost sent -2024-05-22 08:37:19.921830 y25BEPT8PiA from=testuser@localhost to=testuser@localhost sent ---- PASS: TestAuthOnSMTP (0.12s) +_ queue.go:342 Queue.SendLoop Z5lqk3cvvYA: all done +2023-04-21 04:15:49.566723 Z5lqk3cvvYA from=testuser@localhost all done +2023-04-21 04:15:49.691086 127.0.0.1:48914 auth succeeded for testuser@localhost +_ conn.go:684 SMTP.Conn 127.0.0.1:48914: Queued from testuser@localhost to [to@localhost] - Cq8Xh1FAJUE +2023-04-21 04:15:49.692455 Cq8Xh1FAJUE from=testuser@localhost queued ip=127.0.0.1:48914 to=[to@localhost] +_ queue.go:308 Queue.SendLoop Cq8Xh1FAJUE: from testuser@localhost +_ queue.go:367 Queue.SendLoop Cq8Xh1FAJUE: testuser@localhost sent +2023-04-21 04:15:49.692732 Cq8Xh1FAJUE from=testuser@localhost to=testuser@localhost sent +--- PASS: TestAuthOnSMTP (0.13s) === RUN TestBrokenAuth -_ queue.go:342 Queue.SendLoop y25BEPT8PiA: all done -2024-05-22 08:37:19.922016 y25BEPT8PiA from=testuser@localhost all done -_ conn.go:1075 SMTP.Conn 127.0.0.1:46448: error: error authenticating \"user\"@\"broken\": failed to auth -2024-05-22 08:37:20.037132 127.0.0.1:46448 auth failed for user@broken -_ conn.go:298 SMTP.Conn 127.0.0.1:46448: error: AUTH failed: 454 4.7.0 Temporary authentication failure -_ conn.go:298 SMTP.Conn 127.0.0.1:46448: error: unknown<\"*\"> failed: 500 5.5.1 Unknown command +_ queue.go:342 Queue.SendLoop Cq8Xh1FAJUE: all done +2023-04-21 04:15:49.693261 Cq8Xh1FAJUE from=testuser@localhost all done +_ conn.go:1075 SMTP.Conn 127.0.0.1:53450: error: error authenticating \"user\"@\"broken\": failed to auth +2023-04-21 04:15:49.807559 127.0.0.1:53450 auth failed for user@broken +_ conn.go:298 SMTP.Conn 127.0.0.1:53450: error: AUTH failed: 454 4.7.0 Temporary authentication failure +_ conn.go:298 SMTP.Conn 127.0.0.1:53450: error: unknown<\"*\"> failed: 500 5.5.1 Unknown command --- PASS: TestBrokenAuth (0.12s) === RUN TestWrongMailParsing -_ conn.go:298 SMTP.Conn 127.0.0.1:57834: error: MAIL failed: 501 5.1.7 Sender address malformed -_ conn.go:298 SMTP.Conn 127.0.0.1:57834: error: RCPT failed: 501 5.1.3 Malformed destination address -_ conn.go:298 SMTP.Conn 127.0.0.1:57834: error: RCPT failed: 501 5.1.3 Malformed destination address -_ conn.go:305 SMTP.Conn 127.0.0.1:57834: error: too many errors, breaking connection -_ conn.go:298 SMTP.Conn 127.0.0.1:57846: error: MAIL failed: 501 5.1.7 Sender address malformed -_ conn.go:298 SMTP.Conn 127.0.0.1:57846: error: RCPT failed: 501 5.1.3 Malformed destination address -_ conn.go:298 SMTP.Conn 127.0.0.1:57846: error: RCPT failed: 501 5.1.3 Malformed destination address -_ conn.go:305 SMTP.Conn 127.0.0.1:57846: error: too many errors, breaking connection -_ conn.go:298 SMTP.Conn 127.0.0.1:57850: error: MAIL failed: 501 5.1.7 Sender address malformed -_ conn.go:298 SMTP.Conn 127.0.0.1:57850: error: RCPT failed: 501 5.1.3 Malformed destination address -_ conn.go:298 SMTP.Conn 127.0.0.1:57850: error: RCPT failed: 501 5.1.3 Malformed destination address -_ conn.go:305 SMTP.Conn 127.0.0.1:57850: error: too many errors, breaking connection -_ conn.go:298 SMTP.Conn 127.0.0.1:57866: error: MAIL failed: 501 5.1.7 Sender address malformed -_ conn.go:298 SMTP.Conn 127.0.0.1:57866: error: RCPT failed: 501 5.1.3 Malformed destination address -_ conn.go:298 SMTP.Conn 127.0.0.1:57866: error: RCPT failed: 501 5.1.3 Malformed destination address -_ conn.go:305 SMTP.Conn 127.0.0.1:57866: error: too many errors, breaking connection -_ conn.go:298 SMTP.Conn 127.0.0.1:57868: error: MAIL failed: 501 5.1.7 Sender address malformed -_ conn.go:298 SMTP.Conn 127.0.0.1:57868: error: RCPT failed: 501 5.1.3 Malformed destination address -_ conn.go:298 SMTP.Conn 127.0.0.1:57868: error: RCPT failed: 501 5.1.3 Malformed destination address -_ conn.go:305 SMTP.Conn 127.0.0.1:57868: error: too many errors, breaking connection -_ conn.go:298 SMTP.Conn 127.0.0.1:57882: error: MAIL failed: 501 5.1.7 Sender address malformed -_ conn.go:298 SMTP.Conn 127.0.0.1:57882: error: RCPT failed: 501 5.1.3 Malformed destination address -_ conn.go:298 SMTP.Conn 127.0.0.1:57882: error: RCPT failed: 501 5.1.3 Malformed destination address -_ conn.go:305 SMTP.Conn 127.0.0.1:57882: error: too many errors, breaking connection ---- PASS: TestWrongMailParsing (0.00s) +_ conn.go:298 SMTP.Conn 127.0.0.1:43050: error: MAIL failed: 501 5.1.7 Sender address malformed +_ conn.go:298 SMTP.Conn 127.0.0.1:43050: error: RCPT failed: 501 5.1.3 Malformed destination address +_ conn.go:298 SMTP.Conn 127.0.0.1:43050: error: RCPT failed: 501 5.1.3 Malformed destination address +_ conn.go:305 SMTP.Conn 127.0.0.1:43050: error: too many errors, breaking connection +_ conn.go:298 SMTP.Conn 127.0.0.1:43054: error: MAIL failed: 501 5.1.7 Sender address malformed +_ conn.go:298 SMTP.Conn 127.0.0.1:43054: error: RCPT failed: 501 5.1.3 Malformed destination address +_ conn.go:298 SMTP.Conn 127.0.0.1:43054: error: RCPT failed: 501 5.1.3 Malformed destination address +_ conn.go:305 SMTP.Conn 127.0.0.1:43054: error: too many errors, breaking connection +_ conn.go:298 SMTP.Conn 127.0.0.1:43064: error: MAIL failed: 501 5.1.7 Sender address malformed +_ conn.go:298 SMTP.Conn 127.0.0.1:43064: error: RCPT failed: 501 5.1.3 Malformed destination address +_ conn.go:298 SMTP.Conn 127.0.0.1:43064: error: RCPT failed: 501 5.1.3 Malformed destination address +_ conn.go:305 SMTP.Conn 127.0.0.1:43064: error: too many errors, breaking connection +_ conn.go:298 SMTP.Conn 127.0.0.1:43072: error: MAIL failed: 501 5.1.7 Sender address malformed +_ conn.go:298 SMTP.Conn 127.0.0.1:43072: error: RCPT failed: 501 5.1.3 Malformed destination address +_ conn.go:298 SMTP.Conn 127.0.0.1:43072: error: RCPT failed: 501 5.1.3 Malformed destination address +_ conn.go:305 SMTP.Conn 127.0.0.1:43072: error: too many errors, breaking connection +_ conn.go:298 SMTP.Conn 127.0.0.1:43078: error: MAIL failed: 501 5.1.7 Sender address malformed +_ conn.go:298 SMTP.Conn 127.0.0.1:43078: error: RCPT failed: 501 5.1.3 Malformed destination address +_ conn.go:298 SMTP.Conn 127.0.0.1:43078: error: RCPT failed: 501 5.1.3 Malformed destination address +_ conn.go:305 SMTP.Conn 127.0.0.1:43078: error: too many errors, breaking connection +_ conn.go:298 SMTP.Conn 127.0.0.1:43080: error: MAIL failed: 501 5.1.7 Sender address malformed +_ conn.go:298 SMTP.Conn 127.0.0.1:43080: error: RCPT failed: 501 5.1.3 Malformed destination address +_ conn.go:298 SMTP.Conn 127.0.0.1:43080: error: RCPT failed: 501 5.1.3 Malformed destination address +_ conn.go:305 SMTP.Conn 127.0.0.1:43080: error: too many errors, breaking connection +--- PASS: TestWrongMailParsing (0.01s) === RUN TestNullMailFrom --- PASS: TestNullMailFrom (0.00s) === RUN TestRcptBeforeMail -_ conn.go:298 SMTP.Conn 127.0.0.1:57914: error: RCPT failed: 503 5.5.1 Sender not yet given +_ conn.go:298 SMTP.Conn 127.0.0.1:43096: error: RCPT failed: 503 5.5.1 Sender not yet given --- PASS: TestRcptBeforeMail (0.00s) === RUN TestRcptOption --- PASS: TestRcptOption (0.01s) === RUN TestRelayForbidden -2024-05-22 08:37:20.048697 127.0.0.1:57940 rejected from=from@somewhere to=[to@somewhere] - relay not allowed -_ conn.go:298 SMTP.Conn 127.0.0.1:57940: error: RCPT failed: 503 5.7.1 Relay not allowed +2023-04-21 04:15:49.826446 127.0.0.1:43112 rejected from=from@somewhere to=[to@somewhere] - relay not allowed +_ conn.go:298 SMTP.Conn 127.0.0.1:43112: error: RCPT failed: 503 5.7.1 Relay not allowed --- PASS: TestRelayForbidden (0.00s) === RUN TestTooManyRecipients -2024-05-22 08:37:20.160534 127.0.0.1:46464 auth succeeded for testuser@localhost -_ conn.go:298 SMTP.Conn 127.0.0.1:46464: error: RCPT failed: 452 4.5.3 Too many recipients ---- PASS: TestTooManyRecipients (0.12s) +2023-04-21 04:15:49.951309 127.0.0.1:53462 auth succeeded for testuser@localhost +_ conn.go:298 SMTP.Conn 127.0.0.1:53462: error: RCPT failed: 452 4.5.3 Too many recipients +--- PASS: TestTooManyRecipients (0.13s) === RUN TestRcptBrokenExists -_ conn.go:596 SMTP.Conn 127.0.0.1:57942: error: error checking if user \"to@broken\" exists: failed to check if user exists -2024-05-22 08:37:20.179738 127.0.0.1:57942 rejected from=from@localhost to=[to@broken] - error checking if user exists: failed to check if user exists -_ conn.go:298 SMTP.Conn 127.0.0.1:57942: error: RCPT failed: 451 4.4.3 Temporary error checking address +_ conn.go:596 SMTP.Conn 127.0.0.1:43118: error: error checking if user \"to@broken\" exists: failed to check if user exists +2023-04-21 04:15:49.971499 127.0.0.1:43118 rejected from=from@localhost to=[to@broken] - error checking if user exists: failed to check if user exists +_ conn.go:298 SMTP.Conn 127.0.0.1:43118: error: RCPT failed: 451 4.4.3 Temporary error checking address --- PASS: TestRcptBrokenExists (0.01s) === RUN TestRcptUserDoesNotExist -2024-05-22 08:37:20.186237 127.0.0.1:57950 rejected from=from@localhost to=[doesnotexist@localhost] - local user does not exist -_ conn.go:298 SMTP.Conn 127.0.0.1:57950: error: RCPT failed: 550 5.1.1 Destination address is unknown (user does not exist) +2023-04-21 04:15:49.982467 127.0.0.1:43126 rejected from=from@localhost to=[doesnotexist@localhost] - local user does not exist +_ conn.go:298 SMTP.Conn 127.0.0.1:43126: error: RCPT failed: 550 5.1.1 Destination address is unknown (user does not exist) --- PASS: TestRcptUserDoesNotExist (0.01s) === RUN TestTooMuchData -_ conn.go:684 SMTP.Conn 127.0.0.1:57954: Queued from from@from to [to@localhost] - MG6l3QvVuos -2024-05-22 08:37:20.340459 MG6l3QvVuos from=from@from queued ip=127.0.0.1:57954 to=[to@localhost] -_ queue.go:308 Queue.SendLoop MG6l3QvVuos: from from@from -_ queue.go:367 Queue.SendLoop MG6l3QvVuos: testuser@localhost sent -2024-05-22 08:37:20.340599 MG6l3QvVuos from=from@from to=testuser@localhost sent -_ queue.go:342 Queue.SendLoop MG6l3QvVuos: all done -2024-05-22 08:37:20.355172 MG6l3QvVuos from=from@from all done -_ conn.go:684 SMTP.Conn 127.0.0.1:57954: Queued from from@from to [to@localhost] - LMsVnw_tTGE -2024-05-22 08:37:20.493987 LMsVnw_tTGE from=from@from queued ip=127.0.0.1:57954 to=[to@localhost] -_ queue.go:308 Queue.SendLoop LMsVnw_tTGE: from from@from -_ queue.go:367 Queue.SendLoop LMsVnw_tTGE: testuser@localhost sent -2024-05-22 08:37:20.494132 LMsVnw_tTGE from=from@from to=testuser@localhost sent -_ queue.go:342 Queue.SendLoop LMsVnw_tTGE: all done -2024-05-22 08:37:20.507961 LMsVnw_tTGE from=from@from all done -_ conn.go:298 SMTP.Conn 127.0.0.1:57954: error: DATA failed: 552 5.3.4 Message too big -_ conn.go:684 SMTP.Conn 127.0.0.1:57954: Queued from from@from to [to@localhost] - dEjIQqoipcY -2024-05-22 08:37:20.836090 dEjIQqoipcY from=from@from queued ip=127.0.0.1:57954 to=[to@localhost] -_ queue.go:308 Queue.SendLoop dEjIQqoipcY: from from@from -_ queue.go:367 Queue.SendLoop dEjIQqoipcY: testuser@localhost sent -2024-05-22 08:37:20.836214 dEjIQqoipcY from=from@from to=testuser@localhost sent ---- PASS: TestTooMuchData (0.65s) +_ conn.go:684 SMTP.Conn 127.0.0.1:43136: Queued from from@from to [to@localhost] - wGqGM-L6Jzk +2023-04-21 04:15:50.464471 wGqGM-L6Jzk from=from@from queued ip=127.0.0.1:43136 to=[to@localhost] +_ queue.go:308 Queue.SendLoop wGqGM-L6Jzk: from from@from +_ queue.go:367 Queue.SendLoop wGqGM-L6Jzk: testuser@localhost sent +2023-04-21 04:15:50.464690 wGqGM-L6Jzk from=from@from to=testuser@localhost sent +_ queue.go:342 Queue.SendLoop wGqGM-L6Jzk: all done +2023-04-21 04:15:50.571808 wGqGM-L6Jzk from=from@from all done +_ conn.go:684 SMTP.Conn 127.0.0.1:43136: Queued from from@from to [to@localhost] - rm27eM5fid8 +2023-04-21 04:15:51.112492 rm27eM5fid8 from=from@from queued ip=127.0.0.1:43136 to=[to@localhost] +_ queue.go:308 Queue.SendLoop rm27eM5fid8: from from@from +_ queue.go:367 Queue.SendLoop rm27eM5fid8: testuser@localhost sent +2023-04-21 04:15:51.112700 rm27eM5fid8 from=from@from to=testuser@localhost sent +_ queue.go:342 Queue.SendLoop rm27eM5fid8: all done +2023-04-21 04:15:51.168900 rm27eM5fid8 from=from@from all done +_ conn.go:298 SMTP.Conn 127.0.0.1:43136: error: DATA failed: 552 5.3.4 Message too big +_ conn.go:684 SMTP.Conn 127.0.0.1:43136: Queued from from@from to [to@localhost] - 5Hp-_VjZQ0c +_ queue.go:308 Queue.SendLoop 5Hp-_VjZQ0c: from from@from +_ queue.go:367 Queue.SendLoop 5Hp-_VjZQ0c: testuser@localhost sent +2023-04-21 04:15:51.801196 5Hp-_VjZQ0c from=from@from to=testuser@localhost sent +2023-04-21 04:15:51.800622 5Hp-_VjZQ0c from=from@from queued ip=127.0.0.1:43136 to=[to@localhost] +--- PASS: TestTooMuchData (1.83s) === RUN TestSimpleCommands -_ conn.go:298 SMTP.Conn 127.0.0.1:57960: error: VRFY failed: 502 5.5.1 You have a strange feeling for a moment, then it passes. -_ conn.go:298 SMTP.Conn 127.0.0.1:57960: error: EXPN failed: 502 5.5.1 You feel disoriented for a moment. +_ conn.go:298 SMTP.Conn 127.0.0.1:43138: error: VRFY failed: 502 5.5.1 You have a strange feeling for a moment, then it passes. +_ conn.go:298 SMTP.Conn 127.0.0.1:43138: error: EXPN failed: 502 5.5.1 You feel disoriented for a moment. --- PASS: TestSimpleCommands (0.00s) === RUN TestLongLines -_ conn.go:298 SMTP.Conn 127.0.0.1:57962: error: unknown<\"\"> failed: 500 5.5.1 Unknown command -_ conn.go:322 SMTP.Conn 127.0.0.1:57962: error: exiting with error: line too long +_ conn.go:298 SMTP.Conn 127.0.0.1:43144: error: unknown<\"\"> failed: 500 5.5.1 Unknown command +_ conn.go:322 SMTP.Conn 127.0.0.1:43144: error: exiting with error: line too long --- PASS: TestLongLines (0.00s) === RUN TestReset --- PASS: TestReset (0.00s) === RUN TestRepeatedStartTLS -_ conn.go:298 SMTP.Conn 127.0.0.1:57986: error: STARTTLS failed: 503 5.5.1 You are already wearing that! +_ conn.go:298 SMTP.Conn 127.0.0.1:43158: error: STARTTLS failed: 503 5.5.1 You are already wearing that! --- PASS: TestRepeatedStartTLS (0.01s) === RUN TestStartTLSOnTLS -_ queue.go:342 Queue.SendLoop dEjIQqoipcY: all done -2024-05-22 08:37:20.846763 dEjIQqoipcY from=from@from all done -_ conn.go:298 SMTP.Conn 127.0.0.1:48796: error: STARTTLS failed: 503 5.5.1 You are already wearing that! +_ queue.go:342 Queue.SendLoop 5Hp-_VjZQ0c: all done +2023-04-21 04:15:51.830118 5Hp-_VjZQ0c from=from@from all done +_ conn.go:298 SMTP.Conn 127.0.0.1:40380: error: STARTTLS failed: 503 5.5.1 You are already wearing that! --- PASS: TestStartTLSOnTLS (0.01s) === RUN FuzzConnection === RUN FuzzConnection/3d7e992212e817da7afdb7a4e769ceec1d4047a2e630bec4b35ecd4d55560424 -_ conn.go:298 SMTP.Conn 127.0.0.1:57998: error: RCPT failed: 500 5.5.2 Unknown command -_ conn.go:298 SMTP.Conn 127.0.0.1:57998: error: RCPT failed: 500 5.5.4 Malformed command: EOF -_ conn.go:298 SMTP.Conn 127.0.0.1:57998: error: RCPT failed: 501 5.1.3 Malformed destination address -_ conn.go:305 SMTP.Conn 127.0.0.1:57998: error: too many errors, breaking connection +_ conn.go:298 SMTP.Conn 127.0.0.1:43172: error: RCPT failed: 500 5.5.2 Unknown command +_ conn.go:298 SMTP.Conn 127.0.0.1:43172: error: RCPT failed: 500 5.5.4 Malformed command: EOF +_ conn.go:298 SMTP.Conn 127.0.0.1:43172: error: RCPT failed: 501 5.1.3 Malformed destination address +_ conn.go:305 SMTP.Conn 127.0.0.1:43172: error: too many errors, breaking connection === RUN FuzzConnection/68d8c7b5f149996ffd46ad9a15852165d8c1cbd6c03cceb9382e5add16415c94 -_ conn.go:298 SMTP.Conn 127.0.0.1:58006: error: DATA failed: 503 5.5.1 Invisible customers are not welcome! -_ conn.go:298 SMTP.Conn 127.0.0.1:58006: error: DATA failed: 503 5.5.1 Sender not yet given +_ conn.go:298 SMTP.Conn 127.0.0.1:43184: error: DATA failed: 503 5.5.1 Invisible customers are not welcome! +_ conn.go:298 SMTP.Conn 127.0.0.1:43184: error: DATA failed: 503 5.5.1 Sender not yet given +2023-04-21 04:15:51.840260 127.0.0.1:43184 rejected from=a@b to=[user@testserver] - relay not allowed +_ conn.go:298 SMTP.Conn 127.0.0.1:43184: error: RCPT failed: 503 5.7.1 Relay not allowed +_ conn.go:305 SMTP.Conn 127.0.0.1:43184: error: too many errors, breaking connection === RUN FuzzConnection/79e51b30c215fb19a29855deebf2ed8299b35ca6f14db9681ee504e216c44a7f -2024-05-22 08:37:20.855732 127.0.0.1:58006 rejected from=a@b to=[user@testserver] - relay not allowed -_ conn.go:298 SMTP.Conn 127.0.0.1:58006: error: RCPT failed: 503 5.7.1 Relay not allowed -_ conn.go:305 SMTP.Conn 127.0.0.1:58006: error: too many errors, breaking connection -2024-05-22 08:37:20.855916 127.0.0.1:58014 rejected from=<> to=[user@testserver] - relay not allowed -_ conn.go:298 SMTP.Conn 127.0.0.1:58014: error: RCPT failed: 503 5.7.1 Relay not allowed -_ conn.go:298 SMTP.Conn 127.0.0.1:58014: error: DATA failed: 503 5.5.1 Need an address to send to -_ conn.go:298 SMTP.Conn 127.0.0.1:58014: error: unknown<\"FROM:\"> failed: 500 5.5.1 Unknown command -_ conn.go:305 SMTP.Conn 127.0.0.1:58014: error: too many errors, breaking connection +2023-04-21 04:15:51.840780 127.0.0.1:43188 rejected from=<> to=[user@testserver] - relay not allowed +_ conn.go:298 SMTP.Conn 127.0.0.1:43188: error: RCPT failed: 503 5.7.1 Relay not allowed +_ conn.go:298 SMTP.Conn 127.0.0.1:43188: error: DATA failed: 503 5.5.1 Need an address to send to +_ conn.go:298 SMTP.Conn 127.0.0.1:43188: error: unknown<\"FROM:\"> failed: 500 5.5.1 Unknown command +_ conn.go:305 SMTP.Conn 127.0.0.1:43188: error: too many errors, breaking connection === RUN FuzzConnection/83ab02fccf91c1b9c0c972de745dc2a45d23dc3236f9027e605c3e017d8898fe -_ conn.go:298 SMTP.Conn 127.0.0.1:58024: error: MAIL failed: 500 5.5.2 Unknown command -_ conn.go:298 SMTP.Conn 127.0.0.1:58024: error: MAIL failed: 500 5.5.4 Malformed command: EOF -_ conn.go:298 SMTP.Conn 127.0.0.1:58024: error: MAIL failed: 501 5.1.7 Sender address malformed -_ conn.go:305 SMTP.Conn 127.0.0.1:58024: error: too many errors, breaking connection +_ conn.go:298 SMTP.Conn 127.0.0.1:43190: error: MAIL failed: 500 5.5.2 Unknown command +_ conn.go:298 SMTP.Conn 127.0.0.1:43190: error: MAIL failed: 500 5.5.4 Malformed command: EOF +_ conn.go:298 SMTP.Conn 127.0.0.1:43190: error: MAIL failed: 501 5.1.7 Sender address malformed +_ conn.go:305 SMTP.Conn 127.0.0.1:43190: error: too many errors, breaking connection === RUN FuzzConnection/a24124ade554d7a25de538f2cbbced6245ba60e90d221e51590456e222c80359 -_ conn.go:298 SMTP.Conn 127.0.0.1:58038: error: HELO failed: 501 Invisible customers are not welcome! -_ conn.go:298 SMTP.Conn 127.0.0.1:58038: error: EHLO failed: 501 Invisible customers are not welcome! +_ conn.go:298 SMTP.Conn 127.0.0.1:43196: error: HELO failed: 501 Invisible customers are not welcome! +_ conn.go:298 SMTP.Conn 127.0.0.1:43196: error: EHLO failed: 501 Invisible customers are not welcome! === RUN FuzzConnection/b896b41db27f6e36e4e727ac4f7b3d02fad34d217855c0d433ea3a325951b3bf === RUN FuzzConnection/bf15e6fb937795251090940ac60a37705b36a13e71a9557e7aaf0618ea2cf661 -2024-05-22 08:37:20.857785 127.0.0.1:58050 rejected from=<> to=[user@testserver] - relay not allowed -_ conn.go:298 SMTP.Conn 127.0.0.1:58050: error: RCPT failed: 503 5.7.1 Relay not allowed -_ conn.go:298 SMTP.Conn 127.0.0.1:58050: error: DATA failed: 503 5.5.1 Need an address to send to -_ conn.go:298 SMTP.Conn 127.0.0.1:58050: error: unknown<\"FROM:\"> failed: 500 5.5.1 Unknown command -_ conn.go:305 SMTP.Conn 127.0.0.1:58050: error: too many errors, breaking connection +2023-04-21 04:15:51.843154 127.0.0.1:43216 rejected from=<> to=[user@testserver] - relay not allowed +_ conn.go:298 SMTP.Conn 127.0.0.1:43216: error: RCPT failed: 503 5.7.1 Relay not allowed +_ conn.go:298 SMTP.Conn 127.0.0.1:43216: error: DATA failed: 503 5.5.1 Need an address to send to +_ conn.go:298 SMTP.Conn 127.0.0.1:43216: error: unknown<\"FROM:\"> failed: 500 5.5.1 Unknown command +_ conn.go:305 SMTP.Conn 127.0.0.1:43216: error: too many errors, breaking connection === RUN FuzzConnection/d1b1ccbbb380c53282cc2689c4bd9ff0d03a03698e9be55371739ef95d7dd671 -_ conn.go:298 SMTP.Conn 127.0.0.1:58060: error: AUTH failed: 503 5.7.10 You feel vulnerable -_ conn.go:298 SMTP.Conn 127.0.0.1:58060: error: AUTH failed: 503 5.7.10 You feel vulnerable -_ conn.go:298 SMTP.Conn 127.0.0.1:58060: error: AUTH failed: 503 5.7.10 You feel vulnerable -_ conn.go:305 SMTP.Conn 127.0.0.1:58060: error: too many errors, breaking connection +_ conn.go:298 SMTP.Conn 127.0.0.1:43224: error: AUTH failed: 503 5.7.10 You feel vulnerable +_ conn.go:298 SMTP.Conn 127.0.0.1:43224: error: AUTH failed: 503 5.7.10 You feel vulnerable +_ conn.go:298 SMTP.Conn 127.0.0.1:43224: error: AUTH failed: 503 5.7.10 You feel vulnerable +_ conn.go:305 SMTP.Conn 127.0.0.1:43224: error: too many errors, breaking connection === RUN FuzzConnection/dc70e53325976a3a1067feb0b0c956c5a9abec1c867f8198808ccff83f594ded -_ conn.go:298 SMTP.Conn 127.0.0.1:58072: error: unknown<\"WHATIS\"> failed: 500 5.5.1 Unknown command +_ conn.go:298 SMTP.Conn 127.0.0.1:43238: error: unknown<\"WHATIS\"> failed: 500 5.5.1 Unknown command === RUN FuzzConnection/e7682fde78ce0d78ddc7a818f151b6f04466a2c122197a2e4e8048d194ed72c2 -_ conn.go:298 SMTP.Conn 127.0.0.1:58082: error: AUTH failed: 503 5.7.10 You feel vulnerable +_ conn.go:298 SMTP.Conn 127.0.0.1:43244: error: AUTH failed: 503 5.7.10 You feel vulnerable === RUN FuzzConnection/fd41d0c11b1bb7f89825934b2ec51db1df166e34b4610e8089549eedf2e3635c -_ conn.go:298 SMTP.Conn 127.0.0.1:48808: error: AUTH failed: 534 5.7.9 Asmodeus demands 534 zorkmids for safe passage -_ conn.go:298 SMTP.Conn 127.0.0.1:48808: error: AUTH failed: 501 5.5.2 Error decoding AUTH response: illegal base64 data at input byte 28 -2024-05-22 08:37:20.976399 127.0.0.1:48808 auth failed for user@testserver -_ conn.go:298 SMTP.Conn 127.0.0.1:48808: error: AUTH failed: 535 5.7.8 Incorrect user or password -_ conn.go:305 SMTP.Conn 127.0.0.1:48808: error: too many errors, breaking connection +_ conn.go:298 SMTP.Conn 127.0.0.1:40396: error: AUTH failed: 534 5.7.9 Asmodeus demands 534 zorkmids for safe passage +_ conn.go:298 SMTP.Conn 127.0.0.1:40396: error: AUTH failed: 501 5.5.2 Error decoding AUTH response: illegal base64 data at input byte 28 +2023-04-21 04:15:51.965611 127.0.0.1:40396 auth failed for user@testserver +_ conn.go:298 SMTP.Conn 127.0.0.1:40396: error: AUTH failed: 535 5.7.8 Incorrect user or password +_ conn.go:305 SMTP.Conn 127.0.0.1:40396: error: too many errors, breaking connection --- PASS: FuzzConnection (0.13s) --- PASS: FuzzConnection/3d7e992212e817da7afdb7a4e769ceec1d4047a2e630bec4b35ecd4d55560424 (0.00s) --- PASS: FuzzConnection/68d8c7b5f149996ffd46ad9a15852165d8c1cbd6c03cceb9382e5add16415c94 (0.00s) @@ -1608,7 +1650,7 @@ --- PASS: FuzzConnection/e7682fde78ce0d78ddc7a818f151b6f04466a2c122197a2e4e8048d194ed72c2 (0.00s) --- PASS: FuzzConnection/fd41d0c11b1bb7f89825934b2ec51db1df166e34b4610e8089549eedf2e3635c (0.12s) PASS -ok blitiri.com.ar/go/chasquid/internal/smtpsrv 1.731s +ok blitiri.com.ar/go/chasquid/internal/smtpsrv 3.322s === RUN TestParsePolicy sts_test.go:90: pol1: &{Version:STSv1 Mode:enforce MXs:[*.mail.example.com] MaxAge:34h17m36s} --- PASS: TestParsePolicy (0.00s) @@ -1626,16 +1668,16 @@ --- PASS: TestFetch (0.00s) === RUN TestPolicyTooBig sts_test.go:242: got error as expected: MTA-STS TXT record missing ---- PASS: TestPolicyTooBig (0.01s) +--- PASS: TestPolicyTooBig (0.02s) === RUN TestCacheBasics - testlib.go:32: test directory: "/tmp/testlib_113348953" + testlib.go:32: test directory: "/tmp/testlib_1272325973" sts_test.go:277: cache fetched domain.com: &{STSv1 enforce [*.mail.domain.com] 1h0m0s} sts_test.go:286: cache fetched domain.com: &{STSv1 enforce [*.mail.domain.com] 1h0m0s} sts_test.go:300: cache fetched domain.com: &{STSv1 enforce [*.mail.domain.com] 1h0m0s} sts_test.go:309: cache fetched domErr: --- PASS: TestCacheBasics (0.00s) === RUN TestCacheBadData - testlib.go:32: test directory: "/tmp/testlib_131267351" + testlib.go:32: test directory: "/tmp/testlib_3824411668" sts_test.go:349: cache fetched domain.com: &{STSv1 enforce [*.mail.domain.com] 1h0m0s} sts_test.go:363: cache fetched domain.com: &{STSv1 enforce [*.mail.domain.com] 1h0m0s} sts_test.go:372: cache fetched domain.com: &{STSv1 enforce [*.mail.domain.com] 1h0m0s} @@ -1644,13 +1686,13 @@ sts_test.go:372: cache fetched domain.com: &{STSv1 enforce [*.mail.domain.com] 1h0m0s} --- PASS: TestCacheBadData (0.00s) === RUN TestCacheRefresh - testlib.go:32: test directory: "/tmp/testlib_1466529915" + testlib.go:32: test directory: "/tmp/testlib_3934145896" sts_test.go:389: Fetch "refresh-test": &{STSv1 enforce [mx] 1m40s} sts_test.go:389: Fetch "refresh-test": &{STSv1 enforce [mx] 1m40s} sts_test.go:389: Fetch "refresh-test": &{STSv1 enforce [mx] 3m20s} --- PASS: TestCacheRefresh (0.01s) === RUN TestCacheSlashSafe - testlib.go:32: test directory: "/tmp/testlib_3257951544" + testlib.go:32: test directory: "/tmp/testlib_1900171438" sts_test.go:464: recovered: domain contains slash --- PASS: TestCacheSlashSafe (0.00s) === RUN TestURLForDomain @@ -1660,9 +1702,9 @@ === RUN TestHTTPGet --- PASS: TestHTTPGet (0.00s) PASS -ok blitiri.com.ar/go/chasquid/internal/sts 0.041s +ok blitiri.com.ar/go/chasquid/internal/sts 0.086s === RUN TestBasic - testlib.go:32: test directory: "/tmp/testlib_3181455538" + testlib.go:32: test directory: "/tmp/testlib_798738620" --- PASS: TestBasic (0.00s) === RUN TestRemoveCheck testlib_test.go:33: recovered: invalid/dangerous directory @@ -1673,52 +1715,52 @@ testlib_test.go:60: recovered: invalid/dangerous path --- PASS: TestRewriteSafeguard (0.00s) === RUN TestRewrite - testlib.go:32: test directory: "/tmp/testlib_80888582" + testlib.go:32: test directory: "/tmp/testlib_1215175221" --- PASS: TestRewrite (0.00s) === RUN TestGetFreePort --- PASS: TestGetFreePort (0.00s) === RUN TestWaitFor --- PASS: TestWaitFor (0.02s) === RUN TestGenerateCert - testlib.go:32: test directory: "/tmp/testlib_3212096833" ---- PASS: TestGenerateCert (0.09s) + testlib.go:32: test directory: "/tmp/testlib_3481876381" +--- PASS: TestGenerateCert (0.10s) === RUN TestGenerateCertBadDir --- PASS: TestGenerateCertBadDir (0.11s) PASS -ok blitiri.com.ar/go/chasquid/internal/testlib 0.223s +ok blitiri.com.ar/go/chasquid/internal/testlib 0.246s === RUN TestVersionName --- PASS: TestVersionName (0.00s) === RUN TestCipherSuiteName --- PASS: TestCipherSuiteName (0.00s) PASS -ok blitiri.com.ar/go/chasquid/internal/tlsconst 0.003s +ok blitiri.com.ar/go/chasquid/internal/tlsconst 0.012s ? blitiri.com.ar/go/chasquid/internal/trace [no test files] === RUN TestEmptyLoad - userdb_test.go:37: file: "/tmp/userdb_test2286056873" - userdb_test.go:37: file: "/tmp/userdb_test1621968616" + userdb_test.go:37: file: "/tmp/userdb_test2500376363" + userdb_test.go:37: file: "/tmp/userdb_test2009520515" --- PASS: TestEmptyLoad (0.00s) === RUN TestWrite - userdb_test.go:37: file: "/tmp/userdb_test1254626523" ---- PASS: TestWrite (0.60s) + userdb_test.go:37: file: "/tmp/userdb_test1250505877" +--- PASS: TestWrite (0.99s) === RUN TestNew ---- PASS: TestNew (0.08s) +--- PASS: TestNew (0.19s) === RUN TestInvalidUsername - userdb_test.go:37: file: "/tmp/userdb_test149003742" + userdb_test.go:37: file: "/tmp/userdb_test744261008" --- PASS: TestInvalidUsername (0.00s) === RUN TestPlainScheme - userdb_test.go:37: file: "/tmp/userdb_test2403251237" + userdb_test.go:37: file: "/tmp/userdb_test3754100982" --- PASS: TestPlainScheme (0.00s) === RUN TestReload - userdb_test.go:37: file: "/tmp/userdb_test3847359452" + userdb_test.go:37: file: "/tmp/userdb_test1672857848" --- PASS: TestReload (0.00s) === RUN TestRemoveUser - userdb_test.go:37: file: "/tmp/userdb_test1172482690" ---- PASS: TestRemoveUser (0.09s) + userdb_test.go:37: file: "/tmp/userdb_test1940655184" +--- PASS: TestRemoveUser (0.20s) === RUN TestExists - userdb_test.go:37: file: "/tmp/userdb_test884205452" ---- PASS: TestExists (0.09s) + userdb_test.go:37: file: "/tmp/userdb_test3109294620" +--- PASS: TestExists (0.16s) PASS -ok blitiri.com.ar/go/chasquid/internal/userdb 0.866s +ok blitiri.com.ar/go/chasquid/internal/userdb 1.551s create-stamp debian/debhelper-build-stamp dh_testroot -O--buildsystem=golang dh_prep -O--buildsystem=golang @@ -1781,12 +1823,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/32447/tmp/hooks/B01_cleanup starting +I: user script /srv/workspace/pbuilder/32447/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/93536 and its subdirectories -I: Current time: Wed May 22 08:37:38 -12 2024 -I: pbuilder-time-stamp: 1716410258 +I: removing directory /srv/workspace/pbuilder/32447 and its subdirectories +I: Current time: Fri Apr 21 04:16:17 +14 2023 +I: pbuilder-time-stamp: 1682000177