[HOME] [DOWNLOAD] [DOCS] [NEWS] [SUPPORT] [TIPS] [ISSUES] [DONATE]

The following messages acquired while changing from stable to tester

A- in whonix workstation the messages are:

1- ERROR: GPG download signature could NOT be verified.
Tor Browser update failed! Try again later.
gpg_bash_lib_output_diagnostic_message:
gpg_bash_lib_internal_gpg_verify_status_fd_file: /home/user/.tb/gpgtmpdir/gpg_bash_lib_internal_gpg_verify_status_fd_file gpg_bash_lib_internal_gpg_verify_output_file: /home/user/.tb/gpgtmpdir/gpg_bash_lib_internal_gpg_verify_output_file gpg_bash_lib_output_gpg_import_output: gpg: key 93298290: public key "Tor Browser Developers (signing key) " imported gpg: Total number processed: 1 gpg: imported: 1 (RSA: 1) gpg: no ultimately trusted keys found gpg_bash_lib_output_gpg_verify_output: gpg: Signature made Wed 25 Feb 2015 07:58:21 AM UTC using RSA key ID F65C2036 gpg: BAD signature from "Tor Browser Developers (signing key) " gpg_bash_lib_output_gpg_verify_status_fd_output:

2- ERROR: timesync_post_error has been run with the following error text:
############################################

Error detected! Please report this bug!

BASH_SOURCE: /usr/lib/sdwdate/modules.d/sdwdate

SDW_EXIT_ON_ERROR: 1

SDW_MODE: daemon

SDWDATE_SUBSHELL_SCLOCKADJ_EXIT_CODE: 1

exit_code: 127

error_cause: sdwdate_error_handler signal ERR detected with BASH_COMMAND: sdwdate_error “$FUNCNAME: subshell for sclockadj exited with unexpected non-zero exit code: $SDWDATE_SUBSHELL_SCLOCKADJ_EXIT_CODE”

############################################

3- Warning: Could not find ‘/usr/lib/whonixsetup’, starting ‘/bin/bash’ instead. Please check your profile settings.

^^^ this message when starts from the terminal from both gateway and workstation

4- WARNING: Tor Browser Update Check Result: Installed Tor Browser version: 4.5a3. Latest recommend Tor Browser version(s): 4.5a4 4.5a4 4.0.4 4.0.4. Please run:
Start menu -> Applications -> System -> Tor Browser Updater

^^^ this one i cant update even if i go to tor browser updater

B- in whonix gateway

1- error_text: title="$(cat “/var/run/msgcollector/$who_ami/$(identifier).titlex”)"

2-ERROR: timsync_post_error has been run with the following error text:
BASH_SOURCE: /usr/lib/sdwdate/modules.d/sdwdate
SDW_EXIT_ON_ERROR: 1
SDWDATE_SUBSHELL_SCLOCKADJ_EXIT_CODE: 1
exit_code: 127

(note*: i have typed the gateway messages with my hands which mean it may contain typing errors and the second message i didnt write it fully because i think its enough to know the cause or the problem from it)

this is i think my first post with title , thnx for everyone whos working on this project. hope to c more from u and i hope i did help u with this (hope in future i will do better than this one).

Thanks!

[hr]

A 1.

A known bug.

ideally, search them on google or so
search term
"BAD signature from “Tor Browser Developers (signing key)”
the " " make a difference
then google will really search for that term
will lead to this bug report https://trac.torproject.org/projects/tor/ticket/15044

[hr]

A 2.

Needs more information.

TNTBOMBOM: for the second one i need more info. info from /var/log/sdwdate.log
TNTBOMBOM: that error will also be in the log.
TNTBOMBOM: can you search in the log for: find /var/cache/sdwdate -printf
TNTBOMBOM: there could be some interesting information

[hr]

A 3.

Will check later if it’s fixed in latest development version.

[hr]

A 4.

Same bug as A 1.

[hr]

B 1.

Will likely be fixed in next testers version.

[hr]

B 2.

Same as A 2.

thnx for ur fast reply , i did got everything except A 2 how can i give u more infos? what i did is copied the log (in my next comment) and i went to the location that u have typed and 3 notifications went up with these messages:

(workstation notifications)

1- AppArmor Message
Profile: /usr/bin/sdwdate
Operation:mkdir
Name: /var/cache/sdwdate/sclockadj/.ruby_inline/
Denied: c
Logfile: /var/log/kern.log
for more information please see:
https://wiki.ubuntu.com/debuggingapparmor

2- AppArmor Message
Profile: /usr/bin/sdwdate
Operation:exec
Name: /usr/lib/sdwdate/sclockadj_debug_helper
Denied: x
Logfile: /var/log/kern.log
for more information please see:
https://wiki.ubuntu.com/debuggingapparmor

3-AppArmor Message
Profile: /usr/bin/xchat
Operation:mknod
Name: /home/user/.aspell.en.prepl
Denied: c
Logfile: /var/log/kern.log
for more information please see:
https://wiki.ubuntu.com/debuggingapparmor

(gateway arm)

when i open arm it has this message: (i copied only nutty color messages)

Events (TOR/ARM NOTICE - ERR):

19:13:57 [WARN] socks version 71 not recognized. (Tor is not an http proxy.) [1 duplicate hidden]

18:48:29 [WARN] received http status code 404 (“Not found”) from server ‘146.0.42.110:22’ while fetching “/tor/keys/fb/27B6B5996C426270A5C95-488AA5BCEB6BCC86956”

(note*: i have typed the all of the above messages with my hands which mean it may contain typing errors so understand message as a whole if there is an error or ask me to check again for the spelling)

[code] d9886e4b-ff3d-43e7-80e1-cfdd2d3d1756: Loaded. | pid: 2467 | LD_PRELOAD:
d9886e4b-ff3d-43e7-80e1-cfdd2d3d1756: sdwdate_main…
d9886e4b-ff3d-43e7-80e1-cfdd2d3d1756: Running sdwdate…
d9886e4b-ff3d-43e7-80e1-cfdd2d3d1756: sdwdate_preparation: Setting CURL to curl.anondist-orig.
d9886e4b-ff3d-43e7-80e1-cfdd2d3d1756: sdwdate_preparation: who_ami is set to user.
d9886e4b-ff3d-43e7-80e1-cfdd2d3d1756: dispatching pre (SDW_MODE: startup): /usr/lib/timesync/timesync_pre --autostart --mode $SDW_MODE
d9886e4b-ff3d-43e7-80e1-cfdd2d3d1756: dispatching prerequisite (SDW_MODE: startup) (CURL: curl.anondist-orig) (LD_PRELOAD: ): /usr/lib/anon-shared-helper-scripts/te_pe_tb_check
d9886e4b-ff3d-43e7-80e1-cfdd2d3d1756: DISPATCH_PREREQUISITE exited 2 | Tor Bootstrap Result: Tor’s Control Port could not be reached. Did you start Gateway beforehand? Please run whonixcheck on Gateway. | waiting…
d9886e4b-ff3d-43e7-80e1-cfdd2d3d1756: sdwdate (not timesync!): signal SIGTERM received. Cleaning up…
d9886e4b-ff3d-43e7-80e1-cfdd2d3d1756: sdwdate (not timesync!): signal SIGTERM received. Exiting.
8fe198c4-4e0b-4dc8-9fe1-873046a8a703: Loaded. | pid: 2352 | LD_PRELOAD:
8fe198c4-4e0b-4dc8-9fe1-873046a8a703: sdwdate_main…
8fe198c4-4e0b-4dc8-9fe1-873046a8a703: Running sdwdate…
8fe198c4-4e0b-4dc8-9fe1-873046a8a703: sdwdate_preparation: Setting CURL to curl.anondist-orig.
8fe198c4-4e0b-4dc8-9fe1-873046a8a703: sdwdate_preparation: who_ami is set to user.
8fe198c4-4e0b-4dc8-9fe1-873046a8a703: dispatching pre (SDW_MODE: startup): /usr/lib/timesync/timesync_pre --autostart --mode $SDW_MODE
8fe198c4-4e0b-4dc8-9fe1-873046a8a703: dispatching prerequisite (SDW_MODE: startup) (CURL: curl.anondist-orig) (LD_PRELOAD: ): /usr/lib/anon-shared-helper-scripts/te_pe_tb_check
8fe198c4-4e0b-4dc8-9fe1-873046a8a703: DISPATCH_PREREQUISITE exited 2 | Tor Bootstrap Result: Tor’s Control Port could not be reached. Did you start Gateway beforehand? Please run whonixcheck on Gateway. | waiting…
8fe198c4-4e0b-4dc8-9fe1-873046a8a703: DISPATCH_PREREQUISITE exited 0, continuing…
8fe198c4-4e0b-4dc8-9fe1-873046a8a703: getUrlDateDiff: https://boum.org
8fe198c4-4e0b-4dc8-9fe1-873046a8a703: dispatching SDWDATE_CURL_DISPATCH_PRE[SDWDATE_POOL_ONE] (SDW_MODE: startup) (CURL: curl.anondist-orig): /usr/lib/msgcollector/msgcollector --icon /usr/share/icons/anon-icon-pack/timesync.ico --identifier timesync --whoami “$who_ami” --progressbaridx timesync --progressx 15
8fe198c4-4e0b-4dc8-9fe1-873046a8a703: dispatching SDWDATE_CURL_DISPATCH_POST[SDWDATE_POOL_ONE]: /usr/lib/msgcollector/msgcollector --icon /usr/share/icons/anon-icon-pack/timesync.ico --identifier timesync --whoami “$who_ami” --progressbaridx timesync --progressx 30
8fe198c4-4e0b-4dc8-9fe1-873046a8a703: https://boum.org (took 3s) => diff = 250 second(s)
8fe198c4-4e0b-4dc8-9fe1-873046a8a703: getUrlDateDiff: https://wikileaks.org
8fe198c4-4e0b-4dc8-9fe1-873046a8a703: dispatching SDWDATE_CURL_DISPATCH_PRE[SDWDATE_POOL_TWO] (SDW_MODE: startup) (CURL: curl.anondist-orig): /usr/lib/msgcollector/msgcollector --icon /usr/share/icons/anon-icon-pack/timesync.ico --identifier timesync --whoami “$who_ami” --progressbaridx timesync --progressx 45
8fe198c4-4e0b-4dc8-9fe1-873046a8a703: dispatching SDWDATE_CURL_DISPATCH_POST[SDWDATE_POOL_TWO]: /usr/lib/msgcollector/msgcollector --icon /usr/share/icons/anon-icon-pack/timesync.ico --identifier timesync --whoami “$who_ami” --progressbaridx timesync --progressx 60
8fe198c4-4e0b-4dc8-9fe1-873046a8a703: https://wikileaks.org (took 5s) => diff = 252 second(s)
8fe198c4-4e0b-4dc8-9fe1-873046a8a703: getUrlDateDiff: https://privacyfoundation.ch
8fe198c4-4e0b-4dc8-9fe1-873046a8a703: dispatching SDWDATE_CURL_DISPATCH_PRE[SDWDATE_POOL_THREE] (SDW_MODE: startup) (CURL: curl.anondist-orig): /usr/lib/msgcollector/msgcollector --icon /usr/share/icons/anon-icon-pack/timesync.ico --identifier timesync --whoami “$who_ami” --progressbaridx timesync --progressx 65
8fe198c4-4e0b-4dc8-9fe1-873046a8a703: dispatching SDWDATE_CURL_DISPATCH_POST[SDWDATE_POOL_THREE]: /usr/lib/msgcollector/msgcollector --icon /usr/share/icons/anon-icon-pack/timesync.ico --identifier timesync --whoami “$who_ami” --progressbaridx timesync --progressx 80
8fe198c4-4e0b-4dc8-9fe1-873046a8a703: https://privacyfoundation.ch (took 5s) => diff = 252 second(s)
8fe198c4-4e0b-4dc8-9fe1-873046a8a703: Results summary: one: 250 | two: 252 | three: 252 | second(s)
8fe198c4-4e0b-4dc8-9fe1-873046a8a703: Min: 250 | Max: 252 | Median diff: 252 second(s) [252000000000 nanosecond(s)]
8fe198c4-4e0b-4dc8-9fe1-873046a8a703: Time before setting using date: 1424542793.179394291 [Sat Feb 21 18:19:53 UTC 2015]
8fe198c4-4e0b-4dc8-9fe1-873046a8a703: Made up random extra -0.013273145 second[s] [-13273145 nanosecond(s)].
8fe198c4-4e0b-4dc8-9fe1-873046a8a703: Setting time to 1424543044.986726855…
8fe198c4-4e0b-4dc8-9fe1-873046a8a703: Time after setting using date: 1424543044.987220057 [Sat Feb 21 18:24:04 UTC 2015]
8fe198c4-4e0b-4dc8-9fe1-873046a8a703: dispatching post_success (SDW_MODE: startup): /usr/lib/timesync/timesync_post_success --autostart --mode $SDW_MODE
8fe198c4-4e0b-4dc8-9fe1-873046a8a703: Sleeping for 43 minutes.
8fe198c4-4e0b-4dc8-9fe1-873046a8a703: sdwdate (not timesync!): signal SIGTERM received. Cleaning up…
8fe198c4-4e0b-4dc8-9fe1-873046a8a703: sdwdate (not timesync!): signal SIGTERM received. Exiting.
3fefb348-e46a-40be-936e-194d982498b3: Loaded. | pid: 2330 | LD_PRELOAD:
3fefb348-e46a-40be-936e-194d982498b3: sdwdate_main…
3fefb348-e46a-40be-936e-194d982498b3: Running sdwdate…
3fefb348-e46a-40be-936e-194d982498b3: sdwdate_preparation: Setting CURL to curl.anondist-orig.
3fefb348-e46a-40be-936e-194d982498b3: sdwdate_preparation: who_ami is set to user.
3fefb348-e46a-40be-936e-194d982498b3: dispatching pre (SDW_MODE: startup): /usr/lib/timesync/timesync_pre --autostart --mode $SDW_MODE
3fefb348-e46a-40be-936e-194d982498b3: dispatching prerequisite (SDW_MODE: startup) (CURL: curl.anondist-orig) (LD_PRELOAD: ): /usr/lib/anon-shared-helper-scripts/te_pe_tb_check
3fefb348-e46a-40be-936e-194d982498b3: DISPATCH_PREREQUISITE exited 0, continuing…
3fefb348-e46a-40be-936e-194d982498b3: getUrlDateDiff: https://www.immerda.ch
3fefb348-e46a-40be-936e-194d982498b3: dispatching SDWDATE_CURL_DISPATCH_PRE[SDWDATE_POOL_ONE] (SDW_MODE: startup) (CURL: curl.anondist-orig): /usr/lib/msgcollector/msgcollector --icon /usr/share/icons/anon-icon-pack/timesync.ico --identifier timesync --whoami “$who_ami” --progressbaridx timesync --progressx 15
3fefb348-e46a-40be-936e-194d982498b3: dispatching SDWDATE_CURL_DISPATCH_POST[SDWDATE_POOL_ONE]: /usr/lib/msgcollector/msgcollector --icon /usr/share/icons/anon-icon-pack/timesync.ico --identifier timesync --whoami “$who_ami” --progressbaridx timesync --progressx 30
3fefb348-e46a-40be-936e-194d982498b3: https://www.immerda.ch (took 3s) => diff = 139 second(s)
3fefb348-e46a-40be-936e-194d982498b3: getUrlDateDiff: https://wikileaks.org
3fefb348-e46a-40be-936e-194d982498b3: dispatching SDWDATE_CURL_DISPATCH_PRE[SDWDATE_POOL_TWO] (SDW_MODE: startup) (CURL: curl.anondist-orig): /usr/lib/msgcollector/msgcollector --icon /usr/share/icons/anon-icon-pack/timesync.ico --identifier timesync --whoami “$who_ami” --progressbaridx timesync --progressx 45
3fefb348-e46a-40be-936e-194d982498b3: dispatching SDWDATE_CURL_DISPATCH_POST[SDWDATE_POOL_TWO]: /usr/lib/msgcollector/msgcollector --icon /usr/share/icons/anon-icon-pack/timesync.ico --identifier timesync --whoami “$who_ami” --progressbaridx timesync --progressx 60
3fefb348-e46a-40be-936e-194d982498b3: https://wikileaks.org (took 15s) => diff = 116 second(s)
3fefb348-e46a-40be-936e-194d982498b3: getUrlDateDiff: https://www.apache.org
3fefb348-e46a-40be-936e-194d982498b3: dispatching SDWDATE_CURL_DISPATCH_PRE[SDWDATE_POOL_THREE] (SDW_MODE: startup) (CURL: curl.anondist-orig): /usr/lib/msgcollector/msgcollector --icon /usr/share/icons/anon-icon-pack/timesync.ico --identifier timesync --whoami “$who_ami” --progressbaridx timesync --progressx 65
3fefb348-e46a-40be-936e-194d982498b3: dispatching SDWDATE_CURL_DISPATCH_POST[SDWDATE_POOL_THREE]: /usr/lib/msgcollector/msgcollector --icon /usr/share/icons/anon-icon-pack/timesync.ico --identifier timesync --whoami “$who_ami” --progressbaridx timesync --progressx 80
3fefb348-e46a-40be-936e-194d982498b3: https://www.apache.org (took 3s) => diff = 265 second(s)
3fefb348-e46a-40be-936e-194d982498b3: Results summary: one: 139 | two: 116 | three: 265 | second(s)
3fefb348-e46a-40be-936e-194d982498b3: Min: 116 | Max: 265 | Median diff: 139 second(s) [139000000000 nanosecond(s)]
3fefb348-e46a-40be-936e-194d982498b3: Time before setting using date: 1424543927.896552121 [Sat Feb 21 18:38:47 UTC 2015]
3fefb348-e46a-40be-936e-194d982498b3: Made up random extra +0.025409909 second[s] [+25409909 nanosecond(s)].
3fefb348-e46a-40be-936e-194d982498b3: Setting time to 1424544066.025409909…
3fefb348-e46a-40be-936e-194d982498b3: Time after setting using date: 1424544066.026493701 [Sat Feb 21 18:41:06 UTC 2015]
3fefb348-e46a-40be-936e-194d982498b3: dispatching post_success (SDW_MODE: startup): /usr/lib/timesync/timesync_post_success --autostart --mode $SDW_MODE
3fefb348-e46a-40be-936e-194d982498b3: Sleeping for 38 minutes.
3fefb348-e46a-40be-936e-194d982498b3: Running sdwdate…
3fefb348-e46a-40be-936e-194d982498b3: sdwdate_preparation: Setting CURL to curl.anondist-orig.
3fefb348-e46a-40be-936e-194d982498b3: sdwdate_preparation: who_ami is set to user.
3fefb348-e46a-40be-936e-194d982498b3: dispatching pre (SDW_MODE: daemon): /usr/lib/timesync/timesync_pre --autostart --mode $SDW_MODE
3fefb348-e46a-40be-936e-194d982498b3: dispatching prerequisite (SDW_MODE: daemon) (CURL: curl.anondist-orig) (LD_PRELOAD: ): /usr/lib/anon-shared-helper-scripts/te_pe_tb_check
3fefb348-e46a-40be-936e-194d982498b3: DISPATCH_PREREQUISITE exited 0, continuing…
3fefb348-e46a-40be-936e-194d982498b3: getUrlDateDiff: https://tachanka.org
3fefb348-e46a-40be-936e-194d982498b3: dispatching SDWDATE_CURL_DISPATCH_PRE[SDWDATE_POOL_ONE] (SDW_MODE: daemon) (CURL: curl.anondist-orig): /usr/lib/msgcollector/msgcollector --icon /usr/share/icons/anon-icon-pack/timesync.ico --identifier timesync --whoami “$who_ami” --progressbaridx timesync --progressx 15
3fefb348-e46a-40be-936e-194d982498b3: dispatching SDWDATE_CURL_DISPATCH_POST[SDWDATE_POOL_ONE]: /usr/lib/msgcollector/msgcollector --icon /usr/share/icons/anon-icon-pack/timesync.ico --identifier timesync --whoami “$who_ami” --progressbaridx timesync --progressx 30
3fefb348-e46a-40be-936e-194d982498b3: https://tachanka.org (took 4s) => diff = 1 second(s)
3fefb348-e46a-40be-936e-194d982498b3: getUrlDateDiff: https://cve.mitre.org
3fefb348-e46a-40be-936e-194d982498b3: dispatching SDWDATE_CURL_DISPATCH_PRE[SDWDATE_POOL_TWO] (SDW_MODE: daemon) (CURL: curl.anondist-orig): /usr/lib/msgcollector/msgcollector --icon /usr/share/icons/anon-icon-pack/timesync.ico --identifier timesync --whoami “$who_ami” --progressbaridx timesync --progressx 45
3fefb348-e46a-40be-936e-194d982498b3: dispatching SDWDATE_CURL_DISPATCH_POST[SDWDATE_POOL_TWO]: /usr/lib/msgcollector/msgcollector --icon /usr/share/icons/anon-icon-pack/timesync.ico --identifier timesync --whoami “$who_ami” --progressbaridx timesync --progressx 60
3fefb348-e46a-40be-936e-194d982498b3: https://cve.mitre.org (took 4s) => diff = -16 second(s)
3fefb348-e46a-40be-936e-194d982498b3: getUrlDateDiff: https://www.centos.org
3fefb348-e46a-40be-936e-194d982498b3: dispatching SDWDATE_CURL_DISPATCH_PRE[SDWDATE_POOL_THREE] (SDW_MODE: daemon) (CURL: curl.anondist-orig): /usr/lib/msgcollector/msgcollector --icon /usr/share/icons/anon-icon-pack/timesync.ico --identifier timesync --whoami “$who_ami” --progressbaridx timesync --progressx 65
3fefb348-e46a-40be-936e-194d982498b3: dispatching SDWDATE_CURL_DISPATCH_POST[SDWDATE_POOL_THREE]: /usr/lib/msgcollector/msgcollector --icon /usr/share/icons/anon-icon-pack/timesync.ico --identifier timesync --whoami “$who_ami” --progressbaridx timesync --progressx 80
3fefb348-e46a-40be-936e-194d982498b3: https://www.centos.org (took 7s) => diff = 789 second(s)
3fefb348-e46a-40be-936e-194d982498b3: Results summary: one: 1 | two: -16 | three: 789 | second(s)
3fefb348-e46a-40be-936e-194d982498b3: Min: -16 | Max: 789 | Median diff: 1 second(s) [1000000000 nanosecond(s)]
3fefb348-e46a-40be-936e-194d982498b3: Made up random extra +0.707133477 second[s] [+707133477 nanosecond(s)].
3fefb348-e46a-40be-936e-194d982498b3: Launching into background: sudo /usr/lib/sclockadj --no-verbose --no-debug --no-first-wait --move-min 500000 --move-max 500000 --wait-min 1000000000 --wait-max 1000000000 --add 1707133477
3fefb348-e46a-40be-936e-194d982498b3: Started subshell for sclockadj with pid: 27113
3fefb348-e46a-40be-936e-194d982498b3: dispatching post_success (SDW_MODE: daemon): /usr/lib/timesync/timesync_post_success --autostart --mode $SDW_MODE
3fefb348-e46a-40be-936e-194d982498b3: sclockadj reports: Time before running sclockadj: 1424546372.170959416 [Sat Feb 21 19:19:32 UTC 2015]
3fefb348-e46a-40be-936e-194d982498b3: Sleeping for 14 minutes.
3fefb348-e46a-40be-936e-194d982498b3: sdwdate (not timesync!): signal SIGTERM received. Cleaning up…
3fefb348-e46a-40be-936e-194d982498b3: sdwdate_terminate_sclockadj: subshell for sclockadj with pid 27113 still running. Terminating…
3fefb348-e46a-40be-936e-194d982498b3: sclockadj reports: executing: sudo /usr/lib/sclockadj_kill_helper 27121
3fefb348-e46a-40be-936e-194d982498b3: sclockadj reports: sclockadj_kill_helper_output: kill -sigterm 27121
3fefb348-e46a-40be-936e-194d982498b3: sclockadj reports: Exiting…
3fefb348-e46a-40be-936e-194d982498b3: sclockadj reports: was running for 609 s [~ 10.15 min] [~ 0.16 h].
3fefb348-e46a-40be-936e-194d982498b3: sclockadj reports: Time after running sclockadj: 1424546981.535731265 [Sat Feb 21 19:29:41 UTC 2015]
3fefb348-e46a-40be-936e-194d982498b3: sdwdate_terminate_sclockadj: subshell for sclockadj with pid 27113 Terminated.
3fefb348-e46a-40be-936e-194d982498b3: sdwdate (not timesync!): signal SIGTERM received. Exiting.
ab468866-0756-4767-a728-266acda09213: Loaded. | pid: 2408 | LD_PRELOAD:
ab468866-0756-4767-a728-266acda09213: sdwdate_main…
ab468866-0756-4767-a728-266acda09213: Running sdwdate…
ab468866-0756-4767-a728-266acda09213: sdwdate_preparation: Setting CURL to curl.anondist-orig.
ab468866-0756-4767-a728-266acda09213: sdwdate_preparation: who_ami is set to user.
ab468866-0756-4767-a728-266acda09213: dispatching pre (SDW_MODE: startup): /usr/lib/timesync/timesync_pre --autostart --mode $SDW_MODE
ab468866-0756-4767-a728-266acda09213: dispatching prerequisite (SDW_MODE: startup) (CURL: curl.anondist-orig) (LD_PRELOAD: ): /usr/lib/anon-shared-helper-scripts/te_pe_tb_check
ab468866-0756-4767-a728-266acda09213: DISPATCH_PREREQUISITE exited 2 | Tor is not yet fully bootstrapped. 63 % done. Tor reports: NOTICE BOOTSTRAP PROGRESS=63 TAG=loading_descriptors SUMMARY=“Loading relay descriptors” | waiting…
ab468866-0756-4767-a728-266acda09213: DISPATCH_PREREQUISITE exited 0, continuing…
ab468866-0756-4767-a728-266acda09213: getUrlDateDiff: https://www.privacyinternational.org
ab468866-0756-4767-a728-266acda09213: dispatching SDWDATE_CURL_DISPATCH_PRE[SDWDATE_POOL_ONE] (SDW_MODE: startup) (CURL: curl.anondist-orig): /usr/lib/msgcollector/msgcollector --icon /usr/share/icons/anon-icon-pack/timesync.ico --identifier timesync --whoami “$who_ami” --progressbaridx timesync --progressx 15
ab468866-0756-4767-a728-266acda09213: dispatching SDWDATE_CURL_DISPATCH_POST[SDWDATE_POOL_ONE]: /usr/lib/msgcollector/msgcollector --icon /usr/share/icons/anon-icon-pack/timesync.ico --identifier timesync --whoami “$who_ami” --progressbaridx timesync --progressx 30
ab468866-0756-4767-a728-266acda09213: https://www.privacyinternational.org (took 4s) => diff = -28 second(s)
ab468866-0756-4767-a728-266acda09213: getUrlDateDiff: https://wikileaks.org
ab468866-0756-4767-a728-266acda09213: dispatching SDWDATE_CURL_DISPATCH_PRE[SDWDATE_POOL_TWO] (SDW_MODE: startup) (CURL: curl.anondist-orig): /usr/lib/msgcollector/msgcollector --icon /usr/share/icons/anon-icon-pack/timesync.ico --identifier timesync --whoami “$who_ami” --progressbaridx timesync --progressx 45
ab468866-0756-4767-a728-266acda09213: dispatching SDWDATE_CURL_DISPATCH_POST[SDWDATE_POOL_TWO]: /usr/lib/msgcollector/msgcollector --icon /usr/share/icons/anon-icon-pack/timesync.ico --identifier timesync --whoami “$who_ami” --progressbaridx timesync --progressx 60
ab468866-0756-4767-a728-266acda09213: https://wikileaks.org (took 11s) => diff = -88 second(s)
ab468866-0756-4767-a728-266acda09213: getUrlDateDiff: https://www.ccc.de
ab468866-0756-4767-a728-266acda09213: dispatching SDWDATE_CURL_DISPATCH_PRE[SDWDATE_POOL_THREE] (SDW_MODE: startup) (CURL: curl.anondist-orig): /usr/lib/msgcollector/msgcollector --icon /usr/share/icons/anon-icon-pack/timesync.ico --identifier timesync --whoami “$who_ami” --progressbaridx timesync --progressx 65
ab468866-0756-4767-a728-266acda09213: dispatching SDWDATE_CURL_DISPATCH_POST[SDWDATE_POOL_THREE]: /usr/lib/msgcollector/msgcollector --icon /usr/share/icons/anon-icon-pack/timesync.ico --identifier timesync --whoami “$who_ami” --progressbaridx timesync --progressx 80
ab468866-0756-4767-a728-266acda09213: https://www.ccc.de (took 4s) => diff = -61 second(s)
ab468866-0756-4767-a728-266acda09213: Results summary: one: -28 | two: -88 | three: -61 | second(s)
ab468866-0756-4767-a728-266acda09213: Min: -88 | Max: -28 | Median diff: -61 second(s) [-61000000000 nanosecond(s)]
ab468866-0756-4767-a728-266acda09213: Time before setting using date: 1425122633.139549048 [Sat Feb 28 11:23:53 UTC 2015]
ab468866-0756-4767-a728-266acda09213: Made up random extra -0.498747740 second[s] [-498747740 nanosecond(s)].
ab468866-0756-4767-a728-266acda09213: Setting time to 1425122571.501252260…
ab468866-0756-4767-a728-266acda09213: Time after setting using date: 1425122571.501990184 [Sat Feb 28 11:22:51 UTC 2015]
ab468866-0756-4767-a728-266acda09213: dispatching post_success (SDW_MODE: startup): /usr/lib/timesync/timesync_post_success --autostart --mode $SDW_MODE
ab468866-0756-4767-a728-266acda09213: Sleeping for 12 minutes.
ab468866-0756-4767-a728-266acda09213: Running sdwdate…
ab468866-0756-4767-a728-266acda09213: sdwdate_preparation: Setting CURL to curl.anondist-orig.
ab468866-0756-4767-a728-266acda09213: sdwdate_preparation: who_ami is set to user.
ab468866-0756-4767-a728-266acda09213: dispatching pre (SDW_MODE: daemon): /usr/lib/timesync/timesync_pre --autostart --mode $SDW_MODE
ab468866-0756-4767-a728-266acda09213: dispatching prerequisite (SDW_MODE: daemon) (CURL: curl.anondist-orig) (LD_PRELOAD: ): /usr/lib/anon-shared-helper-scripts/te_pe_tb_check
ab468866-0756-4767-a728-266acda09213: DISPATCH_PREREQUISITE exited 0, continuing…
ab468866-0756-4767-a728-266acda09213: getUrlDateDiff: https://squat.net
ab468866-0756-4767-a728-266acda09213: dispatching SDWDATE_CURL_DISPATCH_PRE[SDWDATE_POOL_ONE] (SDW_MODE: daemon) (CURL: curl.anondist-orig): /usr/lib/msgcollector/msgcollector --icon /usr/share/icons/anon-icon-pack/timesync.ico --identifier timesync --whoami “$who_ami” --progressbaridx timesync --progressx 15
ab468866-0756-4767-a728-266acda09213: No file could be downloaded from https://squat.net. (curl_exit_code: 60 | curl_status_message: [60] - [Peer certificate cannot be authenticated with known CA certificates.] - Is your clock much too slow or fast by chance?)
ab468866-0756-4767-a728-266acda09213: getUrlDateDiff: https://tachanka.org
ab468866-0756-4767-a728-266acda09213: dispatching SDWDATE_CURL_DISPATCH_PRE[SDWDATE_POOL_ONE] (SDW_MODE: daemon) (CURL: curl.anondist-orig): /usr/lib/msgcollector/msgcollector --icon /usr/share/icons/anon-icon-pack/timesync.ico --identifier timesync --whoami “$who_ami” --progressbaridx timesync --progressx 15
ab468866-0756-4767-a728-266acda09213: dispatching SDWDATE_CURL_DISPATCH_POST[SDWDATE_POOL_ONE]: /usr/lib/msgcollector/msgcollector --icon /usr/share/icons/anon-icon-pack/timesync.ico --identifier timesync --whoami “$who_ami” --progressbaridx timesync --progressx 30
ab468866-0756-4767-a728-266acda09213: https://tachanka.org (took 5s) => diff = 0 second(s)
ab468866-0756-4767-a728-266acda09213: getUrlDateDiff: https://wikileaks.org
ab468866-0756-4767-a728-266acda09213: dispatching SDWDATE_CURL_DISPATCH_PRE[SDWDATE_POOL_TWO] (SDW_MODE: daemon) (CURL: curl.anondist-orig): /usr/lib/msgcollector/msgcollector --icon /usr/share/icons/anon-icon-pack/timesync.ico --identifier timesync --whoami “$who_ami” --progressbaridx timesync --progressx 45
ab468866-0756-4767-a728-266acda09213: dispatching SDWDATE_CURL_DISPATCH_POST[SDWDATE_POOL_TWO]: /usr/lib/msgcollector/msgcollector --icon /usr/share/icons/anon-icon-pack/timesync.ico --identifier timesync --whoami “$who_ami” --progressbaridx timesync --progressx 60
ab468866-0756-4767-a728-266acda09213: https://wikileaks.org (took 3s) => diff = -26 second(s)
ab468866-0756-4767-a728-266acda09213: getUrlDateDiff: https://www.torservers.net
ab468866-0756-4767-a728-266acda09213: dispatching SDWDATE_CURL_DISPATCH_PRE[SDWDATE_POOL_THREE] (SDW_MODE: daemon) (CURL: curl.anondist-orig): /usr/lib/msgcollector/msgcollector --icon /usr/share/icons/anon-icon-pack/timesync.ico --identifier timesync --whoami “$who_ami” --progressbaridx timesync --progressx 65
ab468866-0756-4767-a728-266acda09213: dispatching SDWDATE_CURL_DISPATCH_POST[SDWDATE_POOL_THREE]: /usr/lib/msgcollector/msgcollector --icon /usr/share/icons/anon-icon-pack/timesync.ico --identifier timesync --whoami “$who_ami” --progressbaridx timesync --progressx 80
ab468866-0756-4767-a728-266acda09213: https://www.torservers.net (took 5s) => diff = 0 second(s)
ab468866-0756-4767-a728-266acda09213: Results summary: one: 0 | two: -26 | three: 0 | second(s)
ab468866-0756-4767-a728-266acda09213: Min: -26 | Max: 0 | Median diff: 0 second(s) [0 nanosecond(s)]
ab468866-0756-4767-a728-266acda09213: No need to set clock.
ab468866-0756-4767-a728-266acda09213: dispatching post_success (SDW_MODE: daemon): /usr/lib/timesync/timesync_post_success --autostart --mode $SDW_MODE
ab468866-0756-4767-a728-266acda09213: Sleeping for 20 minutes.
ab468866-0756-4767-a728-266acda09213: Running sdwdate…
ab468866-0756-4767-a728-266acda09213: sdwdate_preparation: Setting CURL to curl.anondist-orig.
ab468866-0756-4767-a728-266acda09213: sdwdate_preparation: who_ami is set to user.
ab468866-0756-4767-a728-266acda09213: dispatching pre (SDW_MODE: daemon): /usr/lib/timesync/timesync_pre --autostart --mode $SDW_MODE
ab468866-0756-4767-a728-266acda09213: dispatching prerequisite (SDW_MODE: daemon) (CURL: curl.anondist-orig) (LD_PRELOAD: ): /usr/lib/anon-shared-helper-scripts/te_pe_tb_check
ab468866-0756-4767-a728-266acda09213: DISPATCH_PREREQUISITE exited 0, continuing…
ab468866-0756-4767-a728-266acda09213: getUrlDateDiff: https://chavez.indymedia.org
ab468866-0756-4767-a728-266acda09213: dispatching SDWDATE_CURL_DISPATCH_PRE[SDWDATE_POOL_ONE] (SDW_MODE: daemon) (CURL: curl.anondist-orig): /usr/lib/msgcollector/msgcollector --icon /usr/share/icons/anon-icon-pack/timesync.ico --identifier timesync --whoami “$who_ami” --progressbaridx timesync --progressx 15
ab468866-0756-4767-a728-266acda09213: No file could be downloaded from https://chavez.indymedia.org. (curl_exit_code: 7 | curl_status_message: [7] - [Failed to connect to host.])
ab468866-0756-4767-a728-266acda09213: getUrlDateDiff: https://sarava.org
ab468866-0756-4767-a728-266acda09213: dispatching SDWDATE_CURL_DISPATCH_PRE[SDWDATE_POOL_ONE] (SDW_MODE: daemon) (CURL: curl.anondist-orig): /usr/lib/msgcollector/msgcollector --icon /usr/share/icons/anon-icon-pack/timesync.ico --identifier timesync --whoami “$who_ami” --progressbaridx timesync --progressx 15
ab468866-0756-4767-a728-266acda09213: dispatching SDWDATE_CURL_DISPATCH_POST[SDWDATE_POOL_ONE]: /usr/lib/msgcollector/msgcollector --icon /usr/share/icons/anon-icon-pack/timesync.ico --identifier timesync --whoami “$who_ami” --progressbaridx timesync --progressx 30
ab468866-0756-4767-a728-266acda09213: https://sarava.org (took 2s) => diff = 1 second(s)
ab468866-0756-4767-a728-266acda09213: getUrlDateDiff: https://grc.com
ab468866-0756-4767-a728-266acda09213: dispatching SDWDATE_CURL_DISPATCH_PRE[SDWDATE_POOL_TWO] (SDW_MODE: daemon) (CURL: curl.anondist-orig): /usr/lib/msgcollector/msgcollector --icon /usr/share/icons/anon-icon-pack/timesync.ico --identifier timesync --whoami “$who_ami” --progressbaridx timesync --progressx 45
ab468866-0756-4767-a728-266acda09213: dispatching SDWDATE_CURL_DISPATCH_POST[SDWDATE_POOL_TWO]: /usr/lib/msgcollector/msgcollector --icon /usr/share/icons/anon-icon-pack/timesync.ico --identifier timesync --whoami “$who_ami” --progressbaridx timesync --progressx 60
ab468866-0756-4767-a728-266acda09213: https://grc.com (took 4s) => diff = 41 second(s)
ab468866-0756-4767-a728-266acda09213: getUrlDateDiff: https://privacyfoundation.ch
ab468866-0756-4767-a728-266acda09213: dispatching SDWDATE_CURL_DISPATCH_PRE[SDWDATE_POOL_THREE] (SDW_MODE: daemon) (CURL: curl.anondist-orig): /usr/lib/msgcollector/msgcollector --icon /usr/share/icons/anon-icon-pack/timesync.ico --identifier timesync --whoami “$who_ami” --progressbaridx timesync --progressx 65
ab468866-0756-4767-a728-266acda09213: dispatching SDWDATE_CURL_DISPATCH_POST[SDWDATE_POOL_THREE]: /usr/lib/msgcollector/msgcollector --icon /usr/share/icons/anon-icon-pack/timesync.ico --identifier timesync --whoami “$who_ami” --progressbaridx timesync --progressx 80
ab468866-0756-4767-a728-266acda09213: https://privacyfoundation.ch (took 6s) => diff = 0 second(s)
ab468866-0756-4767-a728-266acda09213: Results summary: one: 1 | two: 41 | three: 0 | second(s)
ab468866-0756-4767-a728-266acda09213: Min: 0 | Max: 41 | Median diff: 1 second(s) [1000000000 nanosecond(s)]
ab468866-0756-4767-a728-266acda09213: Made up random extra -0.774802388 second[s] [-774802388 nanosecond(s)].
ab468866-0756-4767-a728-266acda09213: Launching into background: sudo /usr/lib/sclockadj --no-verbose --no-debug --no-first-wait --move-min 500000 --move-max 500000 --wait-min 1000000000 --wait-max 1000000000 --add 225197612
ab468866-0756-4767-a728-266acda09213: Started subshell for sclockadj with pid: 730
ab468866-0756-4767-a728-266acda09213: dispatching post_success (SDW_MODE: daemon): /usr/lib/timesync/timesync_post_success --autostart --mode $SDW_MODE
ab468866-0756-4767-a728-266acda09213: sclockadj reports: Time before running sclockadj: 1425124529.217972854 [Sat Feb 28 11:55:29 UTC 2015]
ab468866-0756-4767-a728-266acda09213: Sleeping for 13 minutes.
ab468866-0756-4767-a728-266acda09213: sclockadj reports: was running for 451 s [~ 7.51 min] [~ 0.12 h].
ab468866-0756-4767-a728-266acda09213: sclockadj reports: Time after running sclockadj: 1425124982.370645040 [Sat Feb 28 12:03:02 UTC 2015]
ab468866-0756-4767-a728-266acda09213: sclockadj reports: exit code: 0
ab468866-0756-4767-a728-266acda09213: Running sdwdate…
ab468866-0756-4767-a728-266acda09213: sdwdate_preparation: Setting CURL to curl.anondist-orig.
ab468866-0756-4767-a728-266acda09213: sdwdate_preparation: who_ami is set to user.
ab468866-0756-4767-a728-266acda09213: dispatching pre (SDW_MODE: daemon): /usr/lib/timesync/timesync_pre --autostart --mode $SDW_MODE
ab468866-0756-4767-a728-266acda09213: dispatching prerequisite (SDW_MODE: daemon) (CURL: curl.anondist-orig) (LD_PRELOAD: ): /usr/lib/anon-shared-helper-scripts/te_pe_tb_check
ab468866-0756-4767-a728-266acda09213: DISPATCH_PREREQUISITE exited 0, continuing…
ab468866-0756-4767-a728-266acda09213: getUrlDateDiff: https://www.1984.is
ab468866-0756-4767-a728-266acda09213: dispatching SDWDATE_CURL_DISPATCH_PRE[SDWDATE_POOL_ONE] (SDW_MODE: daemon) (CURL: curl.anondist-orig): /usr/lib/msgcollector/msgcollector --icon /usr/share/icons/anon-icon-pack/timesync.ico --identifier timesync --whoami “$who_ami” --progressbaridx timesync --progressx 15
ab468866-0756-4767-a728-266acda09213: dispatching SDWDATE_CURL_DISPATCH_POST[SDWDATE_POOL_ONE]: /usr/lib/msgcollector/msgcollector --icon /usr/share/icons/anon-icon-pack/timesync.ico --identifier timesync --whoami “$who_ami” --progressbaridx timesync --progressx 30
ab468866-0756-4767-a728-266acda09213: https://www.1984.is (took 3s) => diff = -1 second(s)
ab468866-0756-4767-a728-266acda09213: getUrlDateDiff: https://grc.com
ab468866-0756-4767-a728-266acda09213: dispatching SDWDATE_CURL_DISPATCH_PRE[SDWDATE_POOL_TWO] (SDW_MODE: daemon) (CURL: curl.anondist-orig): /usr/lib/msgcollector/msgcollector --icon /usr/share/icons/anon-icon-pack/timesync.ico --identifier timesync --whoami “$who_ami” --progressbaridx timesync --progressx 45
ab468866-0756-4767-a728-266acda09213: dispatching SDWDATE_CURL_DISPATCH_POST[SDWDATE_POOL_TWO]: /usr/lib/msgcollector/msgcollector --icon /usr/share/icons/anon-icon-pack/timesync.ico --identifier timesync --whoami “$who_ami” --progressbaridx timesync --progressx 60
ab468866-0756-4767-a728-266acda09213: https://grc.com (took 3s) => diff = 40 second(s)
ab468866-0756-4767-a728-266acda09213: getUrlDateDiff: https://rsf.org
ab468866-0756-4767-a728-266acda09213: dispatching SDWDATE_CURL_DISPATCH_PRE[SDWDATE_POOL_THREE] (SDW_MODE: daemon) (CURL: curl.anondist-orig): /usr/lib/msgcollector/msgcollector --icon /usr/share/icons/anon-icon-pack/timesync.ico --identifier timesync --whoami “$who_ami” --progressbaridx timesync --progressx 65
ab468866-0756-4767-a728-266acda09213: dispatching SDWDATE_CURL_DISPATCH_POST[SDWDATE_POOL_THREE]: /usr/lib/msgcollector/msgcollector --icon /usr/share/icons/anon-icon-pack/timesync.ico --identifier timesync --whoami “$who_ami” --progressbaridx timesync --progressx 80
ab468866-0756-4767-a728-266acda09213: https://rsf.org (took 3s) => diff = -1 second(s)
ab468866-0756-4767-a728-266acda09213: Results summary: one: -1 | two: 40 | three: -1 | second(s)
ab468866-0756-4767-a728-266acda09213: Min: -1 | Max: 40 | Median diff: -1 second(s) [-1000000000 nanosecond(s)]
ab468866-0756-4767-a728-266acda09213: sdwdate_terminate_sclockadj: subshell for sclockadj with pid 730 no longer running. Exit code: 0
ab468866-0756-4767-a728-266acda09213: Made up random extra +0.609885313 second[s] [+609885313 nanosecond(s)].
ab468866-0756-4767-a728-266acda09213: Launching into background: sudo /usr/lib/sclockadj --no-verbose --no-debug --no-first-wait --move-min 500000 --move-max 500000 --wait-min 1000000000 --wait-max 1000000000 --subtract 390114687
ab468866-0756-4767-a728-266acda09213: Started subshell for sclockadj with pid: 10594
ab468866-0756-4767-a728-266acda09213: dispatching post_success (SDW_MODE: daemon): /usr/lib/timesync/timesync_post_success --autostart --mode $SDW_MODE
ab468866-0756-4767-a728-266acda09213: sclockadj reports: Time before running sclockadj: 1425125323.283086823 [Sat Feb 28 12:08:43 UTC 2015]
ab468866-0756-4767-a728-266acda09213: Sleeping for 26 minutes.
ab468866-0756-4767-a728-266acda09213: sclockadj reports: was running for 781 s [~ 13.01 min] [~ 0.21 h].
ab468866-0756-4767-a728-266acda09213: sclockadj reports: Time after running sclockadj: 1425126104.392933924 [Sat Feb 28 12:21:44 UTC 2015]
ab468866-0756-4767-a728-266acda09213: sclockadj reports: exit code: 0
ab468866-0756-4767-a728-266acda09213: Running sdwdate…
ab468866-0756-4767-a728-266acda09213: sdwdate_preparation: Setting CURL to curl.anondist-orig.
ab468866-0756-4767-a728-266acda09213: sdwdate_preparation: who_ami is set to user.
ab468866-0756-4767-a728-266acda09213: dispatching pre (SDW_MODE: daemon): /usr/lib/timesync/timesync_pre --autostart --mode $SDW_MODE
ab468866-0756-4767-a728-266acda09213: dispatching prerequisite (SDW_MODE: daemon) (CURL: curl.anondist-orig) (LD_PRELOAD: ): /usr/lib/anon-shared-helper-scripts/te_pe_tb_check
ab468866-0756-4767-a728-266acda09213: DISPATCH_PREREQUISITE exited 0, continuing…
ab468866-0756-4767-a728-266acda09213: getUrlDateDiff: https://db.debian.org
ab468866-0756-4767-a728-266acda09213: dispatching SDWDATE_CURL_DISPATCH_PRE[SDWDATE_POOL_ONE] (SDW_MODE: daemon) (CURL: curl.anondist-orig): /usr/lib/msgcollector/msgcollector --icon /usr/share/icons/anon-icon-pack/timesync.ico --identifier timesync --whoami “$who_ami” --progressbaridx timesync --progressx 15
ab468866-0756-4767-a728-266acda09213: dispatching SDWDATE_CURL_DISPATCH_POST[SDWDATE_POOL_ONE]: /usr/lib/msgcollector/msgcollector --icon /usr/share/icons/anon-icon-pack/timesync.ico --identifier timesync --whoami “$who_ami” --progressbaridx timesync --progressx 30
ab468866-0756-4767-a728-266acda09213: https://db.debian.org (took 4s) => diff = 0 second(s)
ab468866-0756-4767-a728-266acda09213: getUrlDateDiff: https://wikileaks.org
ab468866-0756-4767-a728-266acda09213: dispatching SDWDATE_CURL_DISPATCH_PRE[SDWDATE_POOL_TWO] (SDW_MODE: daemon) (CURL: curl.anondist-orig): /usr/lib/msgcollector/msgcollector --icon /usr/share/icons/anon-icon-pack/timesync.ico --identifier timesync --whoami “$who_ami” --progressbaridx timesync --progressx 45
ab468866-0756-4767-a728-266acda09213: dispatching SDWDATE_CURL_DISPATCH_POST[SDWDATE_POOL_TWO]: /usr/lib/msgcollector/msgcollector --icon /usr/share/icons/anon-icon-pack/timesync.ico --identifier timesync --whoami “$who_ami” --progressbaridx timesync --progressx 60
ab468866-0756-4767-a728-266acda09213: https://wikileaks.org (took 4s) => diff = 1 second(s)
ab468866-0756-4767-a728-266acda09213: getUrlDateDiff: https://www.centos.org
ab468866-0756-4767-a728-266acda09213: dispatching SDWDATE_CURL_DISPATCH_PRE[SDWDATE_POOL_THREE] (SDW_MODE: daemon) (CURL: curl.anondist-orig): /usr/lib/msgcollector/msgcollector --icon /usr/share/icons/anon-icon-pack/timesync.ico --identifier timesync --whoami “$who_ami” --progressbaridx timesync --progressx 65
ab468866-0756-4767-a728-266acda09213: dispatching SDWDATE_CURL_DISPATCH_POST[SDWDATE_POOL_THREE]: /usr/lib/msgcollector/msgcollector --icon /usr/share/icons/anon-icon-pack/timesync.ico --identifier timesync --whoami “$who_ami” --progressbaridx timesync --progressx 80
ab468866-0756-4767-a728-266acda09213: https://www.centos.org (took 6s) => diff = 822 second(s)
ab468866-0756-4767-a728-266acda09213: Results summary: one: 0 | two: 1 | three: 822 | second(s)
ab468866-0756-4767-a728-266acda09213: Min: 0 | Max: 822 | Median diff: 1 second(s) [1000000000 nanosecond(s)]
ab468866-0756-4767-a728-266acda09213: sdwdate_terminate_sclockadj: subshell for sclockadj with pid 10594 no longer running. Exit code: 0
ab468866-0756-4767-a728-266acda09213: Made up random extra -0.101653711 second[s] [-101653711 nanosecond(s)].
ab468866-0756-4767-a728-266acda09213: Launching into background: sudo /usr/lib/sclockadj --no-verbose --no-debug --no-first-wait --move-min 500000 --move-max 500000 --wait-min 1000000000 --wait-max 1000000000 --add 898346289
ab468866-0756-4767-a728-266acda09213: Started subshell for sclockadj with pid: 15729
ab468866-0756-4767-a728-266acda09213: dispatching post_success (SDW_MODE: daemon): /usr/lib/timesync/timesync_post_success --autostart --mode $SDW_MODE
ab468866-0756-4767-a728-266acda09213: sclockadj reports: Time before running sclockadj: 1425126900.414494330 [Sat Feb 28 12:35:00 UTC 2015]
ab468866-0756-4767-a728-266acda09213: Sleeping for 19 minutes.
ab468866-0756-4767-a728-266acda09213: Running sdwdate…
ab468866-0756-4767-a728-266acda09213: sdwdate_preparation: Setting CURL to curl.anondist-orig.
ab468866-0756-4767-a728-266acda09213: sdwdate_preparation: who_ami is set to user.
ab468866-0756-4767-a728-266acda09213: dispatching pre (SDW_MODE: daemon): /usr/lib/timesync/timesync_pre --autostart --mode $SDW_MODE
ab468866-0756-4767-a728-266acda09213: dispatching prerequisite (SDW_MODE: daemon) (CURL: curl.anondist-orig) (LD_PRELOAD: ): /usr/lib/anon-shared-helper-scripts/te_pe_tb_check
ab468866-0756-4767-a728-266acda09213: DISPATCH_PREREQUISITE exited 0, continuing…
ab468866-0756-4767-a728-266acda09213: getUrlDateDiff: https://www.privacyinternational.org
ab468866-0756-4767-a728-266acda09213: dispatching SDWDATE_CURL_DISPATCH_PRE[SDWDATE_POOL_ONE] (SDW_MODE: daemon) (CURL: curl.anondist-orig): /usr/lib/msgcollector/msgcollector --icon /usr/share/icons/anon-icon-pack/timesync.ico --identifier timesync --whoami “$who_ami” --progressbaridx timesync --progressx 15
ab468866-0756-4767-a728-266acda09213: dispatching SDWDATE_CURL_DISPATCH_POST[SDWDATE_POOL_ONE]: /usr/lib/msgcollector/msgcollector --icon /usr/share/icons/anon-icon-pack/timesync.ico --identifier timesync --whoami “$who_ami” --progressbaridx timesync --progressx 30
ab468866-0756-4767-a728-266acda09213: https://www.privacyinternational.org (took 3s) => diff = 33 second(s)
ab468866-0756-4767-a728-266acda09213: getUrlDateDiff: https://lkml.org
ab468866-0756-4767-a728-266acda09213: dispatching SDWDATE_CURL_DISPATCH_PRE[SDWDATE_POOL_TWO] (SDW_MODE: daemon) (CURL: curl.anondist-orig): /usr/lib/msgcollector/msgcollector --icon /usr/share/icons/anon-icon-pack/timesync.ico --identifier timesync --whoami “$who_ami” --progressbaridx timesync --progressx 45
ab468866-0756-4767-a728-266acda09213: dispatching SDWDATE_CURL_DISPATCH_POST[SDWDATE_POOL_TWO]: /usr/lib/msgcollector/msgcollector --icon /usr/share/icons/anon-icon-pack/timesync.ico --identifier timesync --whoami “$who_ami” --progressbaridx timesync --progressx 60
ab468866-0756-4767-a728-266acda09213: https://lkml.org (took 4s) => diff = -2 second(s)
ab468866-0756-4767-a728-266acda09213: getUrlDateDiff: https://www.calyxinstitute.org
ab468866-0756-4767-a728-266acda09213: dispatching SDWDATE_CURL_DISPATCH_PRE[SDWDATE_POOL_THREE] (SDW_MODE: daemon) (CURL: curl.anondist-orig): /usr/lib/msgcollector/msgcollector --icon /usr/share/icons/anon-icon-pack/timesync.ico --identifier timesync --whoami “$who_ami” --progressbaridx timesync --progressx 65
ab468866-0756-4767-a728-266acda09213: dispatching SDWDATE_CURL_DISPATCH_POST[SDWDATE_POOL_THREE]: /usr/lib/msgcollector/msgcollector --icon /usr/share/icons/anon-icon-pack/timesync.ico --identifier timesync --whoami “$who_ami” --progressbaridx timesync --progressx 80
ab468866-0756-4767-a728-266acda09213: https://www.calyxinstitute.org (took 3s) => diff = -1 second(s)
ab468866-0756-4767-a728-266acda09213: Results summary: one: 33 | two: -2 | three: -1 | second(s)
ab468866-0756-4767-a728-266acda09213: Min: -2 | Max: 33 | Median diff: -1 second(s) [-1000000000 nanosecond(s)]
ab468866-0756-4767-a728-266acda09213: sdwdate_terminate_sclockadj: subshell for sclockadj with pid 15729 still running. Terminating…
ab468866-0756-4767-a728-266acda09213: sclockadj reports: executing: sudo /usr/lib/sclockadj_kill_helper 15737
ab468866-0756-4767-a728-266acda09213: sclockadj reports: sclockadj_kill_helper_output: kill -sigterm 15737
ab468866-0756-4767-a728-266acda09213: sclockadj reports: was running for 1155 s [~ 19.25 min] [~ 0.32 h].
ab468866-0756-4767-a728-266acda09213: sclockadj reports: Time after running sclockadj: 1425128055.009685642 [Sat Feb 28 12:54:15 UTC 2015]
ab468866-0756-4767-a728-266acda09213: sdwdate_terminate_sclockadj: subshell for sclockadj with pid 15729 Terminated.
ab468866-0756-4767-a728-266acda09213: Made up random extra -0.984453567 second[s] [-984453567 nanosecond(s)].
ab468866-0756-4767-a728-266acda09213: Launching into background: sudo /usr/lib/sclockadj --no-verbose --no-debug --no-first-wait --move-min 500000 --move-max 500000 --wait-min 1000000000 --wait-max 1000000000 --subtract 1984453567
ab468866-0756-4767-a728-266acda09213: Started subshell for sclockadj with pid: 19793
ab468866-0756-4767-a728-266acda09213: dispatching post_success (SDW_MODE: daemon): /usr/lib/timesync/timesync_post_success --autostart --mode $SDW_MODE
ab468866-0756-4767-a728-266acda09213: sclockadj reports: Exiting…
ab468866-0756-4767-a728-266acda09213: sclockadj reports: Time before running sclockadj: 1425128055.022678824 [Sat Feb 28 12:54:15 UTC 2015]
ab468866-0756-4767-a728-266acda09213: Sleeping for 47 minutes.
ab468866-0756-4767-a728-266acda09213: sdwdate (not timesync!): signal SIGTERM received. Cleaning up…
ab468866-0756-4767-a728-266acda09213: sdwdate_terminate_sclockadj: subshell for sclockadj with pid 19793 still running. Terminating…
ab468866-0756-4767-a728-266acda09213: sclockadj reports: executing: sudo /usr/lib/sclockadj_kill_helper 19803
ab468866-0756-4767-a728-266acda09213: sclockadj reports: sclockadj_kill_helper_output: kill -sigterm 19803
ab468866-0756-4767-a728-266acda09213: sclockadj reports: Exiting…
ab468866-0756-4767-a728-266acda09213: sclockadj reports: was running for 517 s [~ 8.61 min] [~ 0.14 h].
ab468866-0756-4767-a728-266acda09213: sclockadj reports: Time after running sclockadj: 1425128572.400452475 [Sat Feb 28 13:02:52 UTC 2015]
ab468866-0756-4767-a728-266acda09213: sdwdate_terminate_sclockadj: subshell for sclockadj with pid 19793 Terminated.
ab468866-0756-4767-a728-266acda09213: sdwdate (not timesync!): signal SIGTERM received. Exiting.
25248: Running sdwdate… pid: 25248 | LD_PRELOAD:
25248: sdwdate_preparation: Setting CURL to curl.anondist-orig.
25248: sdwdate_preparation: who_ami is set to user.
25248: dispatching pre (SDW_MODE: startup): /usr/lib/timesync/timesync_pre --autostart --mode $SDW_MODE
25248: error_message: ############################################

Error detected! Please report this bug!

BASH_SOURCE: /usr/lib/sdwdate/modules.d/sdwdate

SDW_EXIT_ON_ERROR: 1

SDW_MODE: startup

SDWDATE_SUBSHELL_SCLOCKADJ_EXIT_CODE:

exit_code: 1

error_cause: sdwdate_error_handler signal ERR detected with BASH_COMMAND:

/usr/lib/timesync/timesync_pre --autostart --mode $SDW_MODE
############################################
25248: dispatching post_error (SDW_MODE: startup) (SDW_EXIT_ON_ERROR: 1): /usr/lib/timesync/timesync_post_error “$error_message” & disown
25248: dispatching post_error done.
25248: sdwdate (not timesync!): Error detected. Cleaning up…
25248: sdwdate (not timesync!): signal ERR received. Cleaning up…
25248: sdwdate (not timesync!): signal ERR received. Exiting.
25248: sdwdate (not timesync!): Error detected. Exiting.
25248: error_message: ############################################

Error detected! Please report this bug!

BASH_SOURCE: /usr/lib/sdwdate/modules.d/sdwdate

SDW_EXIT_ON_ERROR: 1

SDW_MODE: startup

SDWDATE_SUBSHELL_SCLOCKADJ_EXIT_CODE:

exit_code: 1

error_cause: sdwdate_error_handler signal ERR detected with BASH_COMMAND:

eval_output="$(eval ${1+"$@"} 2>&1)"
############################################
25248: dispatching post_error (SDW_MODE: startup) (SDW_EXIT_ON_ERROR: 1): /usr/lib/timesync/timesync_post_error “$error_message” & disown
25248: dispatching post_error done.
25248: sdwdate (not timesync!): Error detected. Cleaning up…
25248: sdwdate (not timesync!): signal ERR received. Cleaning up…
25248: sdwdate (not timesync!): signal ERR received. Exiting.
25248: sdwdate (not timesync!): Error detected. Exiting.
2512: Running sdwdate… pid: 2512 | LD_PRELOAD:
2512: sdwdate_preparation: Setting CURL to curl.anondist-orig.
2512: sdwdate_preparation: who_ami is set to user.
2512: dispatching pre (SDW_MODE: startup): /usr/lib/timesync/timesync_pre --autostart --identifier “timesync” --progressbaridx “$ID” --mode “$SDW_MODE” --whoami "$who_ami"
2512: dispatching prerequisite (SDW_MODE: startup) (CURL: curl.anondist-orig) (LD_PRELOAD: ): /usr/lib/anon-shared-helper-scripts/te_pe_tb_check
2512: DISPATCH_PREREQUISITE exited 0, continuing…
2512: allowed_member_failures: 5 (debugging information: temp: 5.10 | SDWDATE_POOL_ONE array_length: 15 | array_length_remember: 0)
2512: dispatching SDWDATE_CURL_DISPATCH_PRE[SDWDATE_POOL_ONE] (SDW_MODE: startup) (CURL: curl.anondist-orig): /usr/lib/timesync/timesync_progress --identifier “timesync” --progressbaridx “$ID” --mode “$SDW_MODE” --whoami “$who_ami” --progressx 15
2512: dispatching SDWDATE_CURL_DISPATCH_PRE[SDWDATE_POOL_ONE] done.
2512: getUrlDateDiff: https://boum.org | Sat Feb 28 13:11:15 UTC 2015
2512: dispatching SDWDATE_CURL_DISPATCH_POST[SDWDATE_POOL_ONE]: /usr/lib/timesync/timesync_progress --identifier “timesync” --progressbaridx “$ID” --mode “$SDW_MODE” --whoami “$who_ami” --progressx 30
2512: dispatching SDWDATE_CURL_DISPATCH_POST[SDWDATE_POOL_ONE] done.
2512: WEB_DATE_FROM_TOOL_STRING_LENGTH: 31
2512: https://boum.org (took 66s) => diff = -193 second(s)
2512: allowed_member_failures: 6 (debugging information: temp: 5.78 | SDWDATE_POOL_TWO array_length: 17 | array_length_remember: 0)
2512: dispatching SDWDATE_CURL_DISPATCH_PRE[SDWDATE_POOL_TWO] (SDW_MODE: startup) (CURL: curl.anondist-orig): /usr/lib/timesync/timesync_progress --identifier “timesync” --progressbaridx “$ID” --mode “$SDW_MODE” --whoami “$who_ami” --progressx 45
2512: dispatching SDWDATE_CURL_DISPATCH_PRE[SDWDATE_POOL_TWO] done.
2512: getUrlDateDiff: https://www.gnu.org | Sat Feb 28 13:11:25 UTC 2015
2512: dispatching SDWDATE_CURL_DISPATCH_POST[SDWDATE_POOL_TWO]: /usr/lib/timesync/timesync_progress --identifier “timesync” --progressbaridx “$ID” --mode “$SDW_MODE” --whoami “$who_ami” --progressx 60
2512: dispatching SDWDATE_CURL_DISPATCH_POST[SDWDATE_POOL_TWO] done.
2512: WEB_DATE_FROM_TOOL_STRING_LENGTH: 31
2512: https://www.gnu.org (took 6s) => diff = -186 second(s)
2512: allowed_member_failures: 6 (debugging information: temp: 5.78 | SDWDATE_POOL_THREE array_length: 17 | array_length_remember: 0)
2512: dispatching SDWDATE_CURL_DISPATCH_PRE[SDWDATE_POOL_THREE] (SDW_MODE: startup) (CURL: curl.anondist-orig): /usr/lib/timesync/timesync_progress --identifier “timesync” --progressbaridx “$ID” --mode “$SDW_MODE” --whoami “$who_ami” --progressx 65
2512: dispatching SDWDATE_CURL_DISPATCH_PRE[SDWDATE_POOL_THREE] done.
2512: getUrlDateDiff: https://schneier.com | Sat Feb 28 13:11:30 UTC 2015
2512: dispatching SDWDATE_CURL_DISPATCH_POST[SDWDATE_POOL_THREE]: /usr/lib/timesync/timesync_progress --identifier “timesync” --progressbaridx “$ID” --mode “$SDW_MODE” --whoami “$who_ami” --progressx 80
2512: dispatching SDWDATE_CURL_DISPATCH_POST[SDWDATE_POOL_THREE] done.
2512: WEB_DATE_FROM_TOOL_STRING_LENGTH: 31
2512: https://schneier.com (took 5s) => diff = -187 second(s)
2512: Results summary: one: -193 | two: -186 | three: -187 | second(s)
2512: Min: -193 | Max: -186 | Median diff: -187 second(s) [-187000000000 nanosecond(s)]
2512: local unixtime : 1425129096 | local time : Sat Feb 28 13:11:36 UTC 2015
2512: remote unixtime: 1425128909 | remote time: Sat Feb 28 13:08:29 UTC 2015
2512: Made up random extra -0.027342129 second[s] [-27342129 nanosecond(s)].
2512: Time before setting: 1425129096.117993542 [Sat Feb 28 13:11:36 UTC 2015]
2512: Setting time using date to 1425128908.972657871…
2512: Time after setting using date: 1425128908.973546807 [Sat Feb 28 13:08:28 UTC 2015]
2512: dispatching post_success (SDW_MODE: startup): /usr/lib/timesync/timesync_post_success --autostart --identifier “timesync” --progressbaridx “$ID” --mode “$SDW_MODE” --whoami "$who_ami"
2512: dispatching post_success done.
2512: Sleeping for 39 minutes. (RANDOMIZE: 1)
2512: Running sdwdate… pid: 2512 | LD_PRELOAD:
2512: sdwdate_preparation: Setting CURL to curl.anondist-orig.
2512: sdwdate_preparation: who_ami is set to user.
2512: dispatching pre (SDW_MODE: daemon): /usr/lib/timesync/timesync_pre --autostart --identifier “timesync” --progressbaridx “$ID” --mode “$SDW_MODE” --whoami "$who_ami"
2512: dispatching prerequisite (SDW_MODE: daemon) (CURL: curl.anondist-orig) (LD_PRELOAD: ): /usr/lib/anon-shared-helper-scripts/te_pe_tb_check
2512: DISPATCH_PREREQUISITE exited 0, continuing…
2512: allowed_member_failures: 5 (debugging information: temp: 5.10 | SDWDATE_POOL_ONE array_length: 15 | array_length_remember: 0)
2512: dispatching SDWDATE_CURL_DISPATCH_PRE[SDWDATE_POOL_ONE] (SDW_MODE: daemon) (CURL: curl.anondist-orig): /usr/lib/timesync/timesync_progress --identifier “timesync” --progressbaridx “$ID” --mode “$SDW_MODE” --whoami “$who_ami” --progressx 15
2512: dispatching SDWDATE_CURL_DISPATCH_PRE[SDWDATE_POOL_ONE] done.
2512: getUrlDateDiff: https://mail.riseup.net | Sat Feb 28 13:47:32 UTC 2015
2512: dispatching SDWDATE_CURL_DISPATCH_POST[SDWDATE_POOL_ONE]: /usr/lib/timesync/timesync_progress --identifier “timesync” --progressbaridx “$ID” --mode “$SDW_MODE” --whoami “$who_ami” --progressx 30
2512: dispatching SDWDATE_CURL_DISPATCH_POST[SDWDATE_POOL_ONE] done.
2512: WEB_DATE_FROM_TOOL_STRING_LENGTH: 31
2512: https://mail.riseup.net (took 4s) => diff = 1 second(s)
2512: allowed_member_failures: 6 (debugging information: temp: 5.78 | SDWDATE_POOL_TWO array_length: 17 | array_length_remember: 0)
2512: dispatching SDWDATE_CURL_DISPATCH_PRE[SDWDATE_POOL_TWO] (SDW_MODE: daemon) (CURL: curl.anondist-orig): /usr/lib/timesync/timesync_progress --identifier “timesync” --progressbaridx “$ID” --mode “$SDW_MODE” --whoami “$who_ami” --progressx 45
2512: dispatching SDWDATE_CURL_DISPATCH_PRE[SDWDATE_POOL_TWO] done.
2512: getUrlDateDiff: https://wikileaks.org | Sat Feb 28 13:47:36 UTC 2015
2512: dispatching SDWDATE_CURL_DISPATCH_POST[SDWDATE_POOL_TWO]: /usr/lib/timesync/timesync_progress --identifier “timesync” --progressbaridx “$ID” --mode “$SDW_MODE” --whoami “$who_ami” --progressx 60
2512: dispatching SDWDATE_CURL_DISPATCH_POST[SDWDATE_POOL_TWO] done.
2512: WEB_DATE_FROM_TOOL_STRING_LENGTH: 31
2512: https://wikileaks.org (took 3s) => diff = 1 second(s)
2512: allowed_member_failures: 6 (debugging information: temp: 5.78 | SDWDATE_POOL_THREE array_length: 17 | array_length_remember: 0)
2512: dispatching SDWDATE_CURL_DISPATCH_PRE[SDWDATE_POOL_THREE] (SDW_MODE: daemon) (CURL: curl.anondist-orig): /usr/lib/timesync/timesync_progress --identifier “timesync” --progressbaridx “$ID” --mode “$SDW_MODE” --whoami “$who_ami” --progressx 65
2512: dispatching SDWDATE_CURL_DISPATCH_PRE[SDWDATE_POOL_THREE] done.
2512: getUrlDateDiff: https://www.startpage.com | Sat Feb 28 13:47:40 UTC 2015
2512: dispatching SDWDATE_CURL_DISPATCH_POST[SDWDATE_POOL_THREE]: /usr/lib/timesync/timesync_progress --identifier “timesync” --progressbaridx “$ID” --mode “$SDW_MODE” --whoami “$who_ami” --progressx 80
2512: dispatching SDWDATE_CURL_DISPATCH_POST[SDWDATE_POOL_THREE] done.
2512: WEB_DATE_FROM_TOOL_STRING_LENGTH: 31
2512: https://www.startpage.com (took 4s) => diff = -1 second(s)
2512: Results summary: one: 1 | two: 1 | three: -1 | second(s)
2512: Min: -1 | Max: 1 | Median diff: 1 second(s) [1000000000 nanosecond(s)]
2512: local unixtime : 1425131263 | local time : Sat Feb 28 13:47:43 UTC 2015
2512: remote unixtime: 1425131264 | remote time: Sat Feb 28 13:47:44 UTC 2015
2512: Made up random extra -0.635362514 second[s] [-635362514 nanosecond(s)].
2512: Launching into background: sudo INLINEDIR=/var/cache/sdwdate/sclockadj /usr/lib/sdwdate/sclockadj --no-verbose --no-debug --no-first-wait --move-min 500000 --move-max 500000 --wait-min 1000000000 --wait-max 1000000000 --add 364637486
2512: Started subshell for sclockadj with pid: 12619
2512: sdwdate_subshell_read: start
2512: dispatching post_success (SDW_MODE: daemon): /usr/lib/timesync/timesync_post_success --autostart --identifier “timesync” --progressbaridx “$ID” --mode “$SDW_MODE” --whoami "$who_ami"
2512: sdwdate_subshell_read: sclockadj reports: sudo: unable to execute /usr/lib/sdwdate/sclockadj_debug_helper: Permission denied
2512: sdwdate_subshell_read: sclockadj reports: Time before running sclockadj: 1425131263.231807353 [Sat Feb 28 13:47:43 UTC 2015]
2512: sdwdate_subshell_read: sclockadj reports: sdwdate_subshell_wait: Waiting for pid to finish SDWDATE_SCLOCKADJ_COMMAND_PID: 12635
2512: sdwdate_subshell_read: sclockadj reports: /usr/lib/ruby/1.9.1/fileutils.rb:244:in mkdir': Permission denied - /var/cache/sdwdate/sclockadj/.ruby_inline (Errno::EACCES) 2512: sdwdate_subshell_read: sclockadj reports: from /usr/lib/ruby/1.9.1/fileutils.rb:244:infu_mkdir’
2512: sdwdate_subshell_read: sclockadj reports: from /usr/lib/ruby/1.9.1/fileutils.rb:221:in block (2 levels) in mkdir_p' 2512: sdwdate_subshell_read: sclockadj reports: from /usr/lib/ruby/1.9.1/fileutils.rb:219:inreverse_each’
2512: sdwdate_subshell_read: sclockadj reports: from /usr/lib/ruby/1.9.1/fileutils.rb:219:in block in mkdir_p' 2512: sdwdate_subshell_read: sclockadj reports: from /usr/lib/ruby/1.9.1/fileutils.rb:205:ineach’
2512: sdwdate_subshell_read: sclockadj reports: from /usr/lib/ruby/1.9.1/fileutils.rb:205:in mkdir_p' 2512: sdwdate_subshell_read: sclockadj reports: from /usr/lib/ruby/vendor_ruby/inline.rb:544:inbuild’
2512: sdwdate_subshell_read: sclockadj reports: from /usr/lib/ruby/vendor_ruby/inline.rb:843:in inline' 2512: sdwdate_subshell_read: sclockadj reports: from /usr/lib/sdwdate/sclockadj:189:inclass:Cinline
2512: sdwdate_subshell_read: sclockadj reports: from /usr/lib/sdwdate/sclockadj:187:in `'
2512: sdwdate_subshell_read: sclockadj reports: sdwdate_subshell_wait: SDWDATE_SCLOCKADJ_COMMAND_PID: 12635 | SDWDATE_SCLOCKADJ_COMMAND_EXIT_CODE: 1
2512: sdwdate_subshell_read: sclockadj reports: was running for 0 s [~ 0.00 min] [~ 0.00 h].
2512: sdwdate_subshell_read: sclockadj reports: Time after running sclockadj: 1425131263.835395992 [Sat Feb 28 13:47:43 UTC 2015]
2512: sdwdate_subshell_read: sclockadj reports: exit code: 1
2512: sdwdate_subshell_read: end
2512: dispatching post_success done.
2512: Sleeping for 20 minutes. (RANDOMIZE: 1)
2512: Running sdwdate… pid: 2512 | LD_PRELOAD:
2512: sdwdate_preparation: Setting CURL to curl.anondist-orig.
2512: sdwdate_preparation: who_ami is set to user.
2512: dispatching pre (SDW_MODE: daemon): /usr/lib/timesync/timesync_pre --autostart --identifier “timesync” --progressbaridx “$ID” --mode “$SDW_MODE” --whoami "$who_ami"
2512: dispatching prerequisite (SDW_MODE: daemon) (CURL: curl.anondist-orig) (LD_PRELOAD: ): /usr/lib/anon-shared-helper-scripts/te_pe_tb_check
2512: DISPATCH_PREREQUISITE exited 0, continuing…
2512: allowed_member_failures: 5 (debugging information: temp: 5.10 | SDWDATE_POOL_ONE array_length: 15 | array_length_remember: 0)
2512: dispatching SDWDATE_CURL_DISPATCH_PRE[SDWDATE_POOL_ONE] (SDW_MODE: daemon) (CURL: curl.anondist-orig): /usr/lib/timesync/timesync_progress --identifier “timesync” --progressbaridx “$ID” --mode “$SDW_MODE” --whoami “$who_ami” --progressx 15
2512: dispatching SDWDATE_CURL_DISPATCH_PRE[SDWDATE_POOL_ONE] done.
2512: getUrlDateDiff: https://freedom.press | Sat Feb 28 14:07:46 UTC 2015
2512: dispatching SDWDATE_CURL_DISPATCH_POST[SDWDATE_POOL_ONE]: /usr/lib/timesync/timesync_progress --identifier “timesync” --progressbaridx “$ID” --mode “$SDW_MODE” --whoami “$who_ami” --progressx 30
2512: dispatching SDWDATE_CURL_DISPATCH_POST[SDWDATE_POOL_ONE] done.
2512: WEB_DATE_FROM_TOOL_STRING_LENGTH: 31
2512: https://freedom.press (took 4s) => diff = 0 second(s)
2512: allowed_member_failures: 6 (debugging information: temp: 5.78 | SDWDATE_POOL_TWO array_length: 17 | array_length_remember: 0)
2512: dispatching SDWDATE_CURL_DISPATCH_PRE[SDWDATE_POOL_TWO] (SDW_MODE: daemon) (CURL: curl.anondist-orig): /usr/lib/timesync/timesync_progress --identifier “timesync” --progressbaridx “$ID” --mode “$SDW_MODE” --whoami “$who_ami” --progressx 45
2512: dispatching SDWDATE_CURL_DISPATCH_PRE[SDWDATE_POOL_TWO] done.
2512: getUrlDateDiff: https://lkml.org | Sat Feb 28 14:07:51 UTC 2015
2512: dispatching SDWDATE_CURL_DISPATCH_POST[SDWDATE_POOL_TWO]: /usr/lib/timesync/timesync_progress --identifier “timesync” --progressbaridx “$ID” --mode “$SDW_MODE” --whoami “$who_ami” --progressx 60
2512: dispatching SDWDATE_CURL_DISPATCH_POST[SDWDATE_POOL_TWO] done.
2512: WEB_DATE_FROM_TOOL_STRING_LENGTH: 31
2512: https://lkml.org (took 4s) => diff = -1 second(s)
2512: allowed_member_failures: 6 (debugging information: temp: 5.78 | SDWDATE_POOL_THREE array_length: 17 | array_length_remember: 0)
2512: dispatching SDWDATE_CURL_DISPATCH_PRE[SDWDATE_POOL_THREE] (SDW_MODE: daemon) (CURL: curl.anondist-orig): /usr/lib/timesync/timesync_progress --identifier “timesync” --progressbaridx “$ID” --mode “$SDW_MODE” --whoami “$who_ami” --progressx 65
2512: dispatching SDWDATE_CURL_DISPATCH_PRE[SDWDATE_POOL_THREE] done.
2512: getUrlDateDiff: https://www.centos.org | Sat Feb 28 14:07:55 UTC 2015
2512: dispatching SDWDATE_CURL_DISPATCH_POST[SDWDATE_POOL_THREE]: /usr/lib/timesync/timesync_progress --identifier “timesync” --progressbaridx “$ID” --mode “$SDW_MODE” --whoami “$who_ami” --progressx 80
2512: dispatching SDWDATE_CURL_DISPATCH_POST[SDWDATE_POOL_THREE] done.
2512: WEB_DATE_FROM_TOOL_STRING_LENGTH: 31
2512: https://www.centos.org (took 5s) => diff = 823 second(s)
2512: Results summary: one: 0 | two: -1 | three: 823 | second(s)
2512: Min: -1 | Max: 823 | Median diff: 0 second(s) [0 nanosecond(s)]
2512: local unixtime : 1425132480 | local time : Sat Feb 28 14:08:00 UTC 2015
2512: remote unixtime: 1425132480 | remote time: Sat Feb 28 14:08:00 UTC 2015
2512: sdwdate_terminate_sclockadj: subshell for sclockadj with pid 12619 no longer running. Exit code: 1
2512: sdwdate_terminate_sclockadj: subshell for sclockadj with pid 12619 exited with unexpected non-zero exit code: 1
2512: error_message: ############################################

Error detected! Please report this bug!

BASH_SOURCE: /usr/lib/sdwdate/modules.d/sdwdate

SDW_EXIT_ON_ERROR: 1

SDW_MODE: daemon

SDWDATE_SUBSHELL_SCLOCKADJ_EXIT_CODE: 1

exit_code: 127

error_cause: sdwdate_error_handler signal ERR detected with BASH_COMMAND:

sdwdate_error “$FUNCNAME: subshell for sclockadj exited with unexpected non-zero exit code: $SDWDATE_SUBSHELL_SCLOCKADJ_EXIT_CODE”
################### ||| Shortened log msg string length!
2512: dispatching post_error (SDW_MODE: daemon) (SDW_EXIT_ON_ERROR: 1): /usr/lib/timesync/timesync_post_error --identifier “timesync” --progressbaridx “$ID” --mode “$SDW_MODE” --whoami “$who_ami” “$error_message” & disown
2512: dispatching post_error done.
2512: sdwdate (not timesync!): Error detected. Cleaning up…
2512: sdwdate (not timesync!): signal ERR received. Cleaning up…
2512: sdwdate (not timesync!): signal ERR received. Exiting.
2512: sdwdate (not timesync!): Error detected. Exiting.
2478: Running sdwdate… pid: 2478 | LD_PRELOAD:
2478: sdwdate_preparation: Setting CURL to curl.anondist-orig.
2478: sdwdate_preparation: who_ami is set to user.
2478: dispatching pre (SDW_MODE: startup): /usr/lib/timesync/timesync_pre --autostart --identifier “timesync” --progressbaridx “$ID” --mode “$SDW_MODE” --whoami "$who_ami"
2478: dispatching prerequisite (SDW_MODE: startup) (CURL: curl.anondist-orig) (LD_PRELOAD: ): /usr/lib/anon-shared-helper-scripts/te_pe_tb_check
2478: DISPATCH_PREREQUISITE exited 0, continuing…
2478: allowed_member_failures: 5 (debugging information: temp: 5.10 | SDWDATE_POOL_ONE array_length: 15 | array_length_remember: 0)
2478: dispatching SDWDATE_CURL_DISPATCH_PRE[SDWDATE_POOL_ONE] (SDW_MODE: startup) (CURL: curl.anondist-orig): /usr/lib/timesync/timesync_progress --identifier “timesync” --progressbaridx “$ID” --mode “$SDW_MODE” --whoami “$who_ami” --progressx 15
2478: dispatching SDWDATE_CURL_DISPATCH_PRE[SDWDATE_POOL_ONE] done.
2478: getUrlDateDiff: https://tachanka.org | Sat Feb 28 14:34:54 UTC 2015
2478: dispatching SDWDATE_CURL_DISPATCH_POST[SDWDATE_POOL_ONE]: /usr/lib/timesync/timesync_progress --identifier “timesync” --progressbaridx “$ID” --mode “$SDW_MODE” --whoami “$who_ami” --progressx 30
2478: dispatching SDWDATE_CURL_DISPATCH_POST[SDWDATE_POOL_ONE] done.
2478: WEB_DATE_FROM_TOOL_STRING_LENGTH: 31
2478: https://tachanka.org (took 63s) => diff = 50 second(s)
2478: allowed_member_failures: 6 (debugging information: temp: 5.78 | SDWDATE_POOL_TWO array_length: 17 | array_length_remember: 0)
2478: dispatching SDWDATE_CURL_DISPATCH_PRE[SDWDATE_POOL_TWO] (SDW_MODE: startup) (CURL: curl.anondist-orig): /usr/lib/timesync/timesync_progress --identifier “timesync” --progressbaridx “$ID” --mode “$SDW_MODE” --whoami “$who_ami” --progressx 45
2478: dispatching SDWDATE_CURL_DISPATCH_PRE[SDWDATE_POOL_TWO] done.
2478: getUrlDateDiff: https://opentechfund.org | Sat Feb 28 14:34:59 UTC 2015
2478: dispatching SDWDATE_CURL_DISPATCH_POST[SDWDATE_POOL_TWO]: /usr/lib/timesync/timesync_progress --identifier “timesync” --progressbaridx “$ID” --mode “$SDW_MODE” --whoami “$who_ami” --progressx 60
2478: dispatching SDWDATE_CURL_DISPATCH_POST[SDWDATE_POOL_TWO] done.
2478: WEB_DATE_FROM_TOOL_STRING_LENGTH: 31
2478: https://opentechfund.org (took 4s) => diff = 50 second(s)
2478: allowed_member_failures: 6 (debugging information: temp: 5.78 | SDWDATE_POOL_THREE array_length: 17 | array_length_remember: 0)
2478: dispatching SDWDATE_CURL_DISPATCH_PRE[SDWDATE_POOL_THREE] (SDW_MODE: startup) (CURL: curl.anondist-orig): /usr/lib/timesync/timesync_progress --identifier “timesync” --progressbaridx “$ID” --mode “$SDW_MODE” --whoami “$who_ami” --progressx 65
2478: dispatching SDWDATE_CURL_DISPATCH_PRE[SDWDATE_POOL_THREE] done.
2478: getUrlDateDiff: https://privacyfoundation.ch | Sat Feb 28 14:35:03 UTC 2015
2478: dispatching SDWDATE_CURL_DISPATCH_POST[SDWDATE_POOL_THREE]: /usr/lib/timesync/timesync_progress --identifier “timesync” --progressbaridx “$ID” --mode “$SDW_MODE” --whoami “$who_ami” --progressx 80
2478: dispatching SDWDATE_CURL_DISPATCH_POST[SDWDATE_POOL_THREE] done.
2478: WEB_DATE_FROM_TOOL_STRING_LENGTH: 31
2478: https://privacyfoundation.ch (took 3s) => diff = 51 second(s)
2478: Results summary: one: 50 | two: 50 | three: 51 | second(s)
2478: Min: 50 | Max: 51 | Median diff: 50 second(s) [50000000000 nanosecond(s)]
2478: local unixtime : 1425134106 | local time : Sat Feb 28 14:35:06 UTC 2015
2478: remote unixtime: 1425134156 | remote time: Sat Feb 28 14:35:56 UTC 2015
2478: Made up random extra -0.070179925 second[s] [-70179925 nanosecond(s)].
2478: Time before setting: 1425134106.874069457 [Sat Feb 28 14:35:06 UTC 2015]
2478: Setting time using date to 1425134155.929820075…
2478: Time after setting using date: 1425134155.930714961 [Sat Feb 28 14:35:55 UTC 2015]
2478: dispatching post_success (SDW_MODE: startup): /usr/lib/timesync/timesync_post_success --autostart --identifier “timesync” --progressbaridx “$ID” --mode “$SDW_MODE” --whoami "$who_ami"
2478: dispatching post_success done.
2478: Sleeping for 26 minutes. (RANDOMIZE: 1)
2478: Running sdwdate… pid: 2478 | LD_PRELOAD:
2478: sdwdate_preparation: Setting CURL to curl.anondist-orig.
2478: sdwdate_preparation: who_ami is set to user.
2478: dispatching pre (SDW_MODE: daemon): /usr/lib/timesync/timesync_pre --autostart --identifier “timesync” --progressbaridx “$ID” --mode “$SDW_MODE” --whoami "$who_ami"
2478: dispatching prerequisite (SDW_MODE: daemon) (CURL: curl.anondist-orig) (LD_PRELOAD: ): /usr/lib/anon-shared-helper-scripts/te_pe_tb_check
2478: DISPATCH_PREREQUISITE exited 0, continuing…
2478: allowed_member_failures: 5 (debugging information: temp: 5.10 | SDWDATE_POOL_ONE array_length: 15 | array_length_remember: 0)
2478: dispatching SDWDATE_CURL_DISPATCH_PRE[SDWDATE_POOL_ONE] (SDW_MODE: daemon) (CURL: curl.anondist-orig): /usr/lib/timesync/timesync_progress --identifier “timesync” --progressbaridx “$ID” --mode “$SDW_MODE” --whoami “$who_ami” --progressx 15
2478: dispatching SDWDATE_CURL_DISPATCH_PRE[SDWDATE_POOL_ONE] done.
2478: getUrlDateDiff: https://debian.org | Sat Feb 28 15:01:59 UTC 2015
2478: dispatching SDWDATE_CURL_DISPATCH_POST[SDWDATE_POOL_ONE]: /usr/lib/timesync/timesync_progress --identifier “timesync” --progressbaridx “$ID” --mode “$SDW_MODE” --whoami “$who_ami” --progressx 30
2478: dispatching SDWDATE_CURL_DISPATCH_POST[SDWDATE_POOL_ONE] done.
2478: WEB_DATE_FROM_TOOL_STRING_LENGTH: 31
2478: https://debian.org (took 5s) => diff = 1 second(s)
2478: allowed_member_failures: 6 (debugging information: temp: 5.78 | SDWDATE_POOL_TWO array_length: 17 | array_length_remember: 0)
2478: dispatching SDWDATE_CURL_DISPATCH_PRE[SDWDATE_POOL_TWO] (SDW_MODE: daemon) (CURL: curl.anondist-orig): /usr/lib/timesync/timesync_progress --identifier “timesync” --progressbaridx “$ID” --mode “$SDW_MODE” --whoami “$who_ami” --progressx 45
2478: dispatching SDWDATE_CURL_DISPATCH_PRE[SDWDATE_POOL_TWO] done.
2478: getUrlDateDiff: https://www.tarsnap.com | Sat Feb 28 15:02:05 UTC 2015
2478: dispatching SDWDATE_CURL_DISPATCH_POST[SDWDATE_POOL_TWO]: /usr/lib/timesync/timesync_progress --identifier “timesync” --progressbaridx “$ID” --mode “$SDW_MODE” --whoami “$who_ami” --progressx 60
2478: dispatching SDWDATE_CURL_DISPATCH_POST[SDWDATE_POOL_TWO] done.
2478: WEB_DATE_FROM_TOOL_STRING_LENGTH: 31
2478: https://www.tarsnap.com (took 4s) => diff = 127 second(s)
2478: allowed_member_failures: 6 (debugging information: temp: 5.78 | SDWDATE_POOL_THREE array_length: 17 | array_length_remember: 0)
2478: dispatching SDWDATE_CURL_DISPATCH_PRE[SDWDATE_POOL_THREE] (SDW_MODE: daemon) (CURL: curl.anondist-orig): /usr/lib/timesync/timesync_progress --identifier “timesync” --progressbaridx “$ID” --mode “$SDW_MODE” --whoami “$who_ami” --progressx 65
2478: dispatching SDWDATE_CURL_DISPATCH_PRE[SDWDATE_POOL_THREE] done.
2478: getUrlDateDiff: https://schneier.com | Sat Feb 28 15:02:09 UTC 2015
2478: dispatching SDWDATE_CURL_DISPATCH_POST[SDWDATE_POOL_THREE]: /usr/lib/timesync/timesync_progress --identifier “timesync” --progressbaridx “$ID” --mode “$SDW_MODE” --whoami “$who_ami” --progressx 80
2478: dispatching SDWDATE_CURL_DISPATCH_POST[SDWDATE_POOL_THREE] done.
2478: WEB_DATE_FROM_TOOL_STRING_LENGTH: 31
2478: https://schneier.com (took 4s) => diff = 2 second(s)
2478: Results summary: one: 1 | two: 127 | three: 2 | second(s)
2478: Min: 1 | Max: 127 | Median diff: 2 second(s) [2000000000 nanosecond(s)]
2478: local unixtime : 1425135733 | local time : Sat Feb 28 15:02:13 UTC 2015
2478: remote unixtime: 1425135735 | remote time: Sat Feb 28 15:02:15 UTC 2015
2478: Made up random extra +0.199354194 second[s] [+199354194 nanosecond(s)].
2478: Launching into background: sudo INLINEDIR=/var/cache/sdwdate/sclockadj /usr/lib/sdwdate/sclockadj --no-verbose --no-debug --no-first-wait --move-min 500000 --move-max 500000 --wait-min 1000000000 --wait-max 1000000000 --add 2199354194
2478: Started subshell for sclockadj with pid: 16064
2478: sdwdate_subshell_read: start
2478: dispatching post_success (SDW_MODE: daemon): /usr/lib/timesync/timesync_post_success --autostart --identifier “timesync” --progressbaridx “$ID” --mode “$SDW_MODE” --whoami "$who_ami"
2478: sdwdate_subshell_read: sclockadj reports: sudo: unable to execute /usr/lib/sdwdate/sclockadj_debug_helper: Permission denied
2478: sdwdate_subshell_read: sclockadj reports: Time before running sclockadj: 1425135733.949862186 [Sat Feb 28 15:02:13 UTC 2015]
2478: sdwdate_subshell_read: sclockadj reports: sdwdate_subshell_wait: Waiting for pid to finish SDWDATE_SCLOCKADJ_COMMAND_PID: 16080
2478: sdwdate_subshell_read: sclockadj reports: /usr/lib/ruby/1.9.1/fileutils.rb:244:in mkdir': Permission denied - /var/cache/sdwdate/sclockadj/.ruby_inline (Errno::EACCES) 2478: sdwdate_subshell_read: sclockadj reports: from /usr/lib/ruby/1.9.1/fileutils.rb:244:infu_mkdir’
2478: sdwdate_subshell_read: sclockadj reports: from /usr/lib/ruby/1.9.1/fileutils.rb:221:in block (2 levels) in mkdir_p' 2478: sdwdate_subshell_read: sclockadj reports: from /usr/lib/ruby/1.9.1/fileutils.rb:219:inreverse_each’
2478: sdwdate_subshell_read: sclockadj reports: from /usr/lib/ruby/1.9.1/fileutils.rb:219:in block in mkdir_p' 2478: sdwdate_subshell_read: sclockadj reports: from /usr/lib/ruby/1.9.1/fileutils.rb:205:ineach’
2478: sdwdate_subshell_read: sclockadj reports: from /usr/lib/ruby/1.9.1/fileutils.rb:205:in mkdir_p' 2478: sdwdate_subshell_read: sclockadj reports: from /usr/lib/ruby/vendor_ruby/inline.rb:544:inbuild’
2478: sdwdate_subshell_read: sclockadj reports: from /usr/lib/ruby/vendor_ruby/inline.rb:843:in inline' 2478: sdwdate_subshell_read: sclockadj reports: from /usr/lib/sdwdate/sclockadj:189:inclass:Cinline
2478: sdwdate_subshell_read: sclockadj reports: from /usr/lib/sdwdate/sclockadj:187:in `'
2478: sdwdate_subshell_read: sclockadj reports: sdwdate_subshell_wait: SDWDATE_SCLOCKADJ_COMMAND_PID: 16080 | SDWDATE_SCLOCKADJ_COMMAND_EXIT_CODE: 1
2478: sdwdate_subshell_read: sclockadj reports: was running for 1 s [~ 0.01 min] [~ 0.00 h].
2478: sdwdate_subshell_read: sclockadj reports: Time after running sclockadj: 1425135734.609162449 [Sat Feb 28 15:02:14 UTC 2015]
2478: sdwdate_subshell_read: sclockadj reports: exit code: 1
2478: sdwdate_subshell_read: end
2478: dispatching post_success done.
2478: Sleeping for 57 minutes. (RANDOMIZE: 1)
2478: Running sdwdate… pid: 2478 | LD_PRELOAD:
2478: sdwdate_preparation: Setting CURL to curl.anondist-orig.
2478: sdwdate_preparation: who_ami is set to user.
2478: dispatching pre (SDW_MODE: daemon): /usr/lib/timesync/timesync_pre --autostart --identifier “timesync” --progressbaridx “$ID” --mode “$SDW_MODE” --whoami "$who_ami"
2478: dispatching prerequisite (SDW_MODE: daemon) (CURL: curl.anondist-orig) (LD_PRELOAD: ): /usr/lib/anon-shared-helper-scripts/te_pe_tb_check
2478: DISPATCH_PREREQUISITE exited 0, continuing…
2478: allowed_member_failures: 5 (debugging information: temp: 5.10 | SDWDATE_POOL_ONE array_length: 15 | array_length_remember: 0)
2478: dispatching SDWDATE_CURL_DISPATCH_PRE[SDWDATE_POOL_ONE] (SDW_MODE: daemon) (CURL: curl.anondist-orig): /usr/lib/timesync/timesync_progress --identifier “timesync” --progressbaridx “$ID” --mode “$SDW_MODE” --whoami “$who_ami” --progressx 15
2478: dispatching SDWDATE_CURL_DISPATCH_PRE[SDWDATE_POOL_ONE] done.
2478: getUrlDateDiff: https://squat.net | Sat Feb 28 15:59:18 UTC 2015
2478: No file could be downloaded from https://squat.net. (took 7s) (curl_exit_code: 60 | curl_status_message: [60] - [Peer certificate cannot be authenticated with known CA certificates.] - Is your clock much too slow or fast by chance?)
2478: allowed_member_failures: 5 (debugging information: temp: 5.10 | SDWDATE_POOL_ONE array_length: 15 | array_length_remember: 1)
2478: dispatching SDWDATE_CURL_DISPATCH_PRE[SDWDATE_POOL_ONE] (SDW_MODE: daemon) (CURL: curl.anondist-orig): /usr/lib/timesync/timesync_progress --identifier “timesync” --progressbaridx “$ID” --mode “$SDW_MODE” --whoami “$who_ami” --progressx 15
2478: dispatching SDWDATE_CURL_DISPATCH_PRE[SDWDATE_POOL_ONE] done.
2478: getUrlDateDiff: https://boum.org | Sat Feb 28 15:59:24 UTC 2015
2478: dispatching SDWDATE_CURL_DISPATCH_POST[SDWDATE_POOL_ONE]: /usr/lib/timesync/timesync_progress --identifier “timesync” --progressbaridx “$ID” --mode “$SDW_MODE” --whoami “$who_ami” --progressx 30
2478: dispatching SDWDATE_CURL_DISPATCH_POST[SDWDATE_POOL_ONE] done.
2478: WEB_DATE_FROM_TOOL_STRING_LENGTH: 31
2478: https://boum.org (took 4s) => diff = 0 second(s)
2478: allowed_member_failures: 6 (debugging information: temp: 5.78 | SDWDATE_POOL_TWO array_length: 17 | array_length_remember: 0)
2478: dispatching SDWDATE_CURL_DISPATCH_PRE[SDWDATE_POOL_TWO] (SDW_MODE: daemon) (CURL: curl.anondist-orig): /usr/lib/timesync/timesync_progress --identifier “timesync” --progressbaridx “$ID” --mode “$SDW_MODE” --whoami “$who_ami” --progressx 45
2478: dispatching SDWDATE_CURL_DISPATCH_PRE[SDWDATE_POOL_TWO] done.
2478: getUrlDateDiff: https://wikileaks.org | Sat Feb 28 15:59:28 UTC 2015
2478: dispatching SDWDATE_CURL_DISPATCH_POST[SDWDATE_POOL_TWO]: /usr/lib/timesync/timesync_progress --identifier “timesync” --progressbaridx “$ID” --mode “$SDW_MODE” --whoami “$who_ami” --progressx 60
2478: dispatching SDWDATE_CURL_DISPATCH_POST[SDWDATE_POOL_TWO] done.
2478: WEB_DATE_FROM_TOOL_STRING_LENGTH: 31
2478: https://wikileaks.org (took 3s) => diff = 1 second(s)
2478: allowed_member_failures: 6 (debugging information: temp: 5.78 | SDWDATE_POOL_THREE array_length: 17 | array_length_remember: 0)
2478: dispatching SDWDATE_CURL_DISPATCH_PRE[SDWDATE_POOL_THREE] (SDW_MODE: daemon) (CURL: curl.anondist-orig): /usr/lib/timesync/timesync_progress --identifier “timesync” --progressbaridx “$ID” --mode “$SDW_MODE” --whoami “$who_ami” --progressx 65
2478: dispatching SDWDATE_CURL_DISPATCH_PRE[SDWDATE_POOL_THREE] done.
2478: getUrlDateDiff: https://www.centos.org | Sat Feb 28 15:59:32 UTC 2015
2478: dispatching SDWDATE_CURL_DISPATCH_POST[SDWDATE_POOL_THREE]: /usr/lib/timesync/timesync_progress --identifier “timesync” --progressbaridx “$ID” --mode “$SDW_MODE” --whoami “$who_ami” --progressx 80
2478: dispatching SDWDATE_CURL_DISPATCH_POST[SDWDATE_POOL_THREE] done.
2478: WEB_DATE_FROM_TOOL_STRING_LENGTH: 31
2478: https://www.centos.org (took 4s) => diff = 824 second(s)
2478: Results summary: one: 0 | two: 1 | three: 824 | second(s)
2478: Min: 0 | Max: 824 | Median diff: 1 second(s) [1000000000 nanosecond(s)]
2478: local unixtime : 1425139176 | local time : Sat Feb 28 15:59:36 UTC 2015
2478: remote unixtime: 1425139177 | remote time: Sat Feb 28 15:59:37 UTC 2015
2478: sdwdate_terminate_sclockadj: subshell for sclockadj with pid 16064 no longer running. Exit code: 1
2478: sdwdate_terminate_sclockadj: subshell for sclockadj with pid 16064 exited with unexpected non-zero exit code: 1
2478: error_message: ############################################

Error detected! Please report this bug!

BASH_SOURCE: /usr/lib/sdwdate/modules.d/sdwdate

SDW_EXIT_ON_ERROR: 1

SDW_MODE: daemon

SDWDATE_SUBSHELL_SCLOCKADJ_EXIT_CODE: 1

exit_code: 127

error_cause: sdwdate_error_handler signal ERR detected with BASH_COMMAND:

sdwdate_error “$FUNCNAME: subshell for sclockadj exited with unexpected non-zero exit code: $SDWDATE_SUBSHELL_SCLOCKADJ_EXIT_CODE”
################### ||| Shortened log msg string length!
2478: dispatching post_error (SDW_MODE: daemon) (SDW_EXIT_ON_ERROR: 1): /usr/lib/timesync/timesync_post_error --identifier “timesync” --progressbaridx “$ID” --mode “$SDW_MODE” --whoami “$who_ami” “$error_message” & disown
2478: dispatching post_error done.
2478: sdwdate (not timesync!): Error detected. Cleaning up…
2478: sdwdate (not timesync!): signal ERR received. Cleaning up…
2478: sdwdate (not timesync!): signal ERR received. Exiting.
2478: sdwdate (not timesync!): Error detected. Exiting.
2479: Running sdwdate… pid: 2479 | LD_PRELOAD:
2479: sdwdate_preparation: Setting CURL to curl.anondist-orig.
2479: sdwdate_preparation: who_ami is set to user.
2479: dispatching pre (SDW_MODE: startup): /usr/lib/timesync/timesync_pre --autostart --identifier “timesync” --progressbaridx “$ID” --mode “$SDW_MODE” --whoami "$who_ami"
2479: dispatching prerequisite (SDW_MODE: startup) (CURL: curl.anondist-orig) (LD_PRELOAD: ): /usr/lib/anon-shared-helper-scripts/te_pe_tb_check
2479: DISPATCH_PREREQUISITE exited 2 | Tor is not yet fully bootstrapped. 15 % done. Tor reports: NOTICE BOOTSTRAP PROGRESS=15 TAG=onehop_create SUMMARY=“Establishing an encrypted directory connection” | waiting…
2479: DISPATCH_PREREQUISITE exited 0, continuing…
2479: allowed_member_failures: 5 (debugging information: temp: 5.10 | SDWDATE_POOL_ONE array_length: 15 | array_length_remember: 0)
2479: dispatching SDWDATE_CURL_DISPATCH_PRE[SDWDATE_POOL_ONE] (SDW_MODE: startup) (CURL: curl.anondist-orig): /usr/lib/timesync/timesync_progress --identifier “timesync” --progressbaridx “$ID” --mode “$SDW_MODE” --whoami “$who_ami” --progressx 15
2479: dispatching SDWDATE_CURL_DISPATCH_PRE[SDWDATE_POOL_ONE] done.
2479: getUrlDateDiff: https://www.torproject.org | Sun Mar 1 21:12:12 UTC 2015
2479: dispatching SDWDATE_CURL_DISPATCH_POST[SDWDATE_POOL_ONE]: /usr/lib/timesync/timesync_progress --identifier “timesync” --progressbaridx “$ID” --mode “$SDW_MODE” --whoami “$who_ami” --progressx 30
2479: dispatching SDWDATE_CURL_DISPATCH_POST[SDWDATE_POOL_ONE] done.
2479: WEB_DATE_FROM_TOOL_STRING_LENGTH: 31
2479: https://www.torproject.org (took 47s) => diff = -51 second(s)
2479: allowed_member_failures: 6 (debugging information: temp: 5.78 | SDWDATE_POOL_TWO array_length: 17 | array_length_remember: 0)
2479: dispatching SDWDATE_CURL_DISPATCH_PRE[SDWDATE_POOL_TWO] (SDW_MODE: startup) (CURL: curl.anondist-orig): /usr/lib/timesync/timesync_progress --identifier “timesync” --progressbaridx “$ID” --mode “$SDW_MODE” --whoami “$who_ami” --progressx 45
2479: dispatching SDWDATE_CURL_DISPATCH_PRE[SDWDATE_POOL_TWO] done.
2479: getUrlDateDiff: https://defectivebydesign.org | Sun Mar 1 21:12:20 UTC 2015
2479: dispatching SDWDATE_CURL_DISPATCH_POST[SDWDATE_POOL_TWO]: /usr/lib/timesync/timesync_progress --identifier “timesync” --progressbaridx “$ID” --mode “$SDW_MODE” --whoami “$who_ami” --progressx 60
2479: dispatching SDWDATE_CURL_DISPATCH_POST[SDWDATE_POOL_TWO] done.
2479: WEB_DATE_FROM_TOOL_STRING_LENGTH: 31
2479: https://defectivebydesign.org (took 10s) => diff = -48 second(s)
2479: allowed_member_failures: 6 (debugging information: temp: 5.78 | SDWDATE_POOL_THREE array_length: 17 | array_length_remember: 0)
2479: dispatching SDWDATE_CURL_DISPATCH_PRE[SDWDATE_POOL_THREE] (SDW_MODE: startup) (CURL: curl.anondist-orig): /usr/lib/timesync/timesync_progress --identifier “timesync” --progressbaridx “$ID” --mode “$SDW_MODE” --whoami “$who_ami” --progressx 65
2479: dispatching SDWDATE_CURL_DISPATCH_PRE[SDWDATE_POOL_THREE] done.
2479: getUrlDateDiff: https://schneier.com | Sun Mar 1 21:12:32 UTC 2015
2479: dispatching SDWDATE_CURL_DISPATCH_POST[SDWDATE_POOL_THREE]: /usr/lib/timesync/timesync_progress --identifier “timesync” --progressbaridx “$ID” --mode “$SDW_MODE” --whoami “$who_ami” --progressx 80
2479: dispatching SDWDATE_CURL_DISPATCH_POST[SDWDATE_POOL_THREE] done.
2479: WEB_DATE_FROM_TOOL_STRING_LENGTH: 31
2479: https://schneier.com (took 5s) => diff = -47 second(s)
2479: Results summary: one: -51 | two: -48 | three: -47 | second(s)
2479: Min: -51 | Max: -47 | Median diff: -48 second(s) [-48000000000 nanosecond(s)]
2479: local unixtime : 1425244358 | local time : Sun Mar 1 21:12:38 UTC 2015
2479: remote unixtime: 1425244310 | remote time: Sun Mar 1 21:11:50 UTC 2015
2479: Made up random extra +0.660374771 second[s] [+660374771 nanosecond(s)].
2479: Time before setting: 1425244358.026917010 [Sun Mar 1 21:12:38 UTC 2015]
2479: Setting time using date to 1425244310.660374771…
2479: Time after setting using date: 1425244310.661185809 [Sun Mar 1 21:11:50 UTC 2015]
2479: dispatching post_success (SDW_MODE: startup): /usr/lib/timesync/timesync_post_success --autostart --identifier “timesync” --progressbaridx “$ID” --mode “$SDW_MODE” --whoami "$who_ami"
2479: dispatching post_success done.
2479: Sleeping for 15 minutes. (RANDOMIZE: 1)
2479: Running sdwdate… pid: 2479 | LD_PRELOAD:
2479: sdwdate_preparation: Setting CURL to curl.anondist-orig.
2479: sdwdate_preparation: who_ami is set to user.
2479: dispatching pre (SDW_MODE: daemon): /usr/lib/timesync/timesync_pre --autostart --identifier “timesync” --progressbaridx “$ID” --mode “$SDW_MODE” --whoami "$who_ami"
2479: dispatching prerequisite (SDW_MODE: daemon) (CURL: curl.anondist-orig) (LD_PRELOAD: ): /usr/lib/anon-shared-helper-scripts/te_pe_tb_check
2479: DISPATCH_PREREQUISITE exited 0, continuing…
2479: allowed_member_failures: 5 (debugging information: temp: 5.10 | SDWDATE_POOL_ONE array_length: 15 | array_length_remember: 0)
2479: dispatching SDWDATE_CURL_DISPATCH_PRE[SDWDATE_POOL_ONE] (SDW_MODE: daemon) (CURL: curl.anondist-orig): /usr/lib/timesync/timesync_progress --identifier “timesync” --progressbaridx “$ID” --mode “$SDW_MODE” --whoami “$who_ami” --progressx 15
2479: dispatching SDWDATE_CURL_DISPATCH_PRE[SDWDATE_POOL_ONE] done.
2479: getUrlDateDiff: https://squat.net | Sun Mar 1 21:26:54 UTC 2015
2479: No file could be downloaded from https://squat.net. (took 3s) (curl_exit_code: 60 | curl_status_message: [60] - [Peer certificate cannot be authenticated with known CA certificates.] - Is your clock much too slow or fast by chance?)
2479: allowed_member_failures: 5 (debugging information: temp: 5.10 | SDWDATE_POOL_ONE array_length: 15 | array_length_remember: 1)
2479: dispatching SDWDATE_CURL_DISPATCH_PRE[SDWDATE_POOL_ONE] (SDW_MODE: daemon) (CURL: curl.anondist-orig): /usr/lib/timesync/timesync_progress --identifier “timesync” --progressbaridx “$ID” --mode “$SDW_MODE” --whoami “$who_ami” --progressx 15
2479: dispatching SDWDATE_CURL_DISPATCH_PRE[SDWDATE_POOL_ONE] done.
2479: getUrlDateDiff: https://db.debian.org | Sun Mar 1 21:26:56 UTC 2015
2479: dispatching SDWDATE_CURL_DISPATCH_POST[SDWDATE_POOL_ONE]: /usr/lib/timesync/timesync_progress --identifier “timesync” --progressbaridx “$ID” --mode “$SDW_MODE” --whoami “$who_ami” --progressx 30
2479: dispatching SDWDATE_CURL_DISPATCH_POST[SDWDATE_POOL_ONE] done.
2479: WEB_DATE_FROM_TOOL_STRING_LENGTH: 31
2479: https://db.debian.org (took 5s) => diff = 0 second(s)
2479: allowed_member_failures: 6 (debugging information: temp: 5.78 | SDWDATE_POOL_TWO array_length: 17 | array_length_remember: 0)
2479: dispatching SDWDATE_CURL_DISPATCH_PRE[SDWDATE_POOL_TWO] (SDW_MODE: daemon) (CURL: curl.anondist-orig): /usr/lib/timesync/timesync_progress --identifier “timesync” --progressbaridx “$ID” --mode “$SDW_MODE” --whoami “$who_ami” --progressx 45
2479: dispatching SDWDATE_CURL_DISPATCH_PRE[SDWDATE_POOL_TWO] done.
2479: getUrlDateDiff: https://en.wikipedia.org | Sun Mar 1 21:27:01 UTC 2015
2479: dispatching SDWDATE_CURL_DISPATCH_POST[SDWDATE_POOL_TWO]: /usr/lib/timesync/timesync_progress --identifier “timesync” --progressbaridx “$ID” --mode “$SDW_MODE” --whoami “$who_ami” --progressx 60
2479: dispatching SDWDATE_CURL_DISPATCH_POST[SDWDATE_POOL_TWO] done.
2479: WEB_DATE_FROM_TOOL_STRING_LENGTH: 31
2479: https://en.wikipedia.org (took 4s) => diff = 1 second(s)
2479: allowed_member_failures: 6 (debugging information: temp: 5.78 | SDWDATE_POOL_THREE array_length: 17 | array_length_remember: 0)
2479: dispatching SDWDATE_CURL_DISPATCH_PRE[SDWDATE_POOL_THREE] (SDW_MODE: daemon) (CURL: curl.anondist-orig): /usr/lib/timesync/timesync_progress --identifier “timesync” --progressbaridx “$ID” --mode “$SDW_MODE” --whoami “$who_ami” --progressx 65
2479: dispatching SDWDATE_CURL_DISPATCH_PRE[SDWDATE_POOL_THREE] done.
2479: getUrlDateDiff: https://en.bitcoin.it | Sun Mar 1 21:27:05 UTC 2015
2479: dispatching SDWDATE_CURL_DISPATCH_POST[SDWDATE_POOL_THREE]: /usr/lib/timesync/timesync_progress --identifier “timesync” --progressbaridx “$ID” --mode “$SDW_MODE” --whoami “$who_ami” --progressx 80
2479: dispatching SDWDATE_CURL_DISPATCH_POST[SDWDATE_POOL_THREE] done.
2479: WEB_DATE_FROM_TOOL_STRING_LENGTH: 31
2479: https://en.bitcoin.it (took 4s) => diff = 1 second(s)
2479: Results summary: one: 0 | two: 1 | three: 1 | second(s)
2479: Min: 0 | Max: 1 | Median diff: 1 second(s) [1000000000 nanosecond(s)]
2479: local unixtime : 1425245229 | local time : Sun Mar 1 21:27:09 UTC 2015
2479: remote unixtime: 1425245230 | remote time: Sun Mar 1 21:27:10 UTC 2015
2479: Made up random extra +0.045250841 second[s] [+45250841 nanosecond(s)].
2479: Launching into background: sudo INLINEDIR=/var/cache/sdwdate/sclockadj /usr/lib/sdwdate/sclockadj --no-verbose --no-debug --no-first-wait --move-min 500000 --move-max 500000 --wait-min 1000000000 --wait-max 1000000000 --add 1045250841
2479: Started subshell for sclockadj with pid: 14538
2479: sdwdate_subshell_read: start
2479: dispatching post_success (SDW_MODE: daemon): /usr/lib/timesync/timesync_post_success --autostart --identifier “timesync” --progressbaridx “$ID” --mode “$SDW_MODE” --whoami "$who_ami"
2479: sdwdate_subshell_read: sclockadj reports: sudo: unable to execute /usr/lib/sdwdate/sclockadj_debug_helper: Permission denied
2479: sdwdate_subshell_read: sclockadj reports: Time before running sclockadj: 1425245229.760245807 [Sun Mar 1 21:27:09 UTC 2015]
2479: sdwdate_subshell_read: sclockadj reports: sdwdate_subshell_wait: Waiting for pid to finish SDWDATE_SCLOCKADJ_COMMAND_PID: 14557
2479: sdwdate_subshell_read: sclockadj reports: /usr/lib/ruby/1.9.1/fileutils.rb:244:in mkdir': Permission denied - /var/cache/sdwdate/sclockadj/.ruby_inline (Errno::EACCES) 2479: sdwdate_subshell_read: sclockadj reports: from /usr/lib/ruby/1.9.1/fileutils.rb:244:infu_mkdir’
2479: sdwdate_subshell_read: sclockadj reports: from /usr/lib/ruby/1.9.1/fileutils.rb:221:in block (2 levels) in mkdir_p' 2479: sdwdate_subshell_read: sclockadj reports: from /usr/lib/ruby/1.9.1/fileutils.rb:219:inreverse_each’
2479: sdwdate_subshell_read: sclockadj reports: from /usr/lib/ruby/1.9.1/fileutils.rb:219:in block in mkdir_p' 2479: sdwdate_subshell_read: sclockadj reports: from /usr/lib/ruby/1.9.1/fileutils.rb:205:ineach’
2479: sdwdate_subshell_read: sclockadj reports: from /usr/lib/ruby/1.9.1/fileutils.rb:205:in mkdir_p' 2479: sdwdate_subshell_read: sclockadj reports: from /usr/lib/ruby/vendor_ruby/inline.rb:544:inbuild’
2479: sdwdate_subshell_read: sclockadj reports: from /usr/lib/ruby/vendor_ruby/inline.rb:843:in inline' 2479: sdwdate_subshell_read: sclockadj reports: from /usr/lib/sdwdate/sclockadj:189:inclass:Cinline
2479: sdwdate_subshell_read: sclockadj reports: from /usr/lib/sdwdate/sclockadj:187:in `'
2479: sdwdate_subshell_read: sclockadj reports: sdwdate_subshell_wait: SDWDATE_SCLOCKADJ_COMMAND_PID: 14557 | SDWDATE_SCLOCKADJ_COMMAND_EXIT_CODE: 1
2479: sdwdate_subshell_read: sclockadj reports: was running for 1 s [~ 0.01 min] [~ 0.00 h].
2479: sdwdate_subshell_read: sclockadj reports: Time after running sclockadj: 1425245230.285157110 [Sun Mar 1 21:27:10 UTC 2015]
2479: sdwdate_subshell_read: sclockadj reports: exit code: 1
2479: sdwdate_subshell_read: end
2479: dispatching post_success done.
2479: Sleeping for 37 minutes. (RANDOMIZE: 1)
2479: Running sdwdate… pid: 2479 | LD_PRELOAD:
2479: sdwdate_preparation: Setting CURL to curl.anondist-orig.
2479: sdwdate_preparation: who_ami is set to user.
2479: dispatching pre (SDW_MODE: daemon): /usr/lib/timesync/timesync_pre --autostart --identifier “timesync” --progressbaridx “$ID” --mode “$SDW_MODE” --whoami "$who_ami"
2479: dispatching prerequisite (SDW_MODE: daemon) (CURL: curl.anondist-orig) (LD_PRELOAD: ): /usr/lib/anon-shared-helper-scripts/te_pe_tb_check
2479: DISPATCH_PREREQUISITE exited 0, continuing…
2479: allowed_member_failures: 5 (debugging information: temp: 5.10 | SDWDATE_POOL_ONE array_length: 15 | array_length_remember: 0)
2479: dispatching SDWDATE_CURL_DISPATCH_PRE[SDWDATE_POOL_ONE] (SDW_MODE: daemon) (CURL: curl.anondist-orig): /usr/lib/timesync/timesync_progress --identifier “timesync” --progressbaridx “$ID” --mode “$SDW_MODE” --whoami “$who_ami” --progressx 15
2479: dispatching SDWDATE_CURL_DISPATCH_PRE[SDWDATE_POOL_ONE] done.
2479: getUrlDateDiff: https://epic.org | Sun Mar 1 22:04:15 UTC 2015
2479: dispatching SDWDATE_CURL_DISPATCH_POST[SDWDATE_POOL_ONE]: /usr/lib/timesync/timesync_progress --identifier “timesync” --progressbaridx “$ID” --mode “$SDW_MODE” --whoami “$who_ami” --progressx 30
2479: dispatching SDWDATE_CURL_DISPATCH_POST[SDWDATE_POOL_ONE] done.
2479: WEB_DATE_FROM_TOOL_STRING_LENGTH: 31
2479: https://epic.org (took 5s) => diff = 1 second(s)
2479: allowed_member_failures: 6 (debugging information: temp: 5.78 | SDWDATE_POOL_TWO array_length: 17 | array_length_remember: 0)
2479: dispatching SDWDATE_CURL_DISPATCH_PRE[SDWDATE_POOL_TWO] (SDW_MODE: daemon) (CURL: curl.anondist-orig): /usr/lib/timesync/timesync_progress --identifier “timesync” --progressbaridx “$ID” --mode “$SDW_MODE” --whoami “$who_ami” --progressx 45
2479: dispatching SDWDATE_CURL_DISPATCH_PRE[SDWDATE_POOL_TWO] done.
2479: getUrlDateDiff: https://www.tarsnap.com | Sun Mar 1 22:04:20 UTC 2015
2479: dispatching SDWDATE_CURL_DISPATCH_POST[SDWDATE_POOL_TWO]: /usr/lib/timesync/timesync_progress --identifier “timesync” --progressbaridx “$ID” --mode “$SDW_MODE” --whoami “$who_ami” --progressx 60
2479: dispatching SDWDATE_CURL_DISPATCH_POST[SDWDATE_POOL_TWO] done.
2479: WEB_DATE_FROM_TOOL_STRING_LENGTH: 31
2479: https://www.tarsnap.com (took 5s) => diff = 129 second(s)
2479: allowed_member_failures: 6 (debugging information: temp: 5.78 | SDWDATE_POOL_THREE array_length: 17 | array_length_remember: 0)
2479: dispatching SDWDATE_CURL_DISPATCH_PRE[SDWDATE_POOL_THREE] (SDW_MODE: daemon) (CURL: curl.anondist-orig): /usr/lib/timesync/timesync_progress --identifier “timesync” --progressbaridx “$ID” --mode “$SDW_MODE” --whoami “$who_ami” --progressx 65
2479: dispatching SDWDATE_CURL_DISPATCH_PRE[SDWDATE_POOL_THREE] done.
2479: getUrlDateDiff: https://www.accessnow.org | Sun Mar 1 22:04:25 UTC 2015
2479: dispatching SDWDATE_CURL_DISPATCH_POST[SDWDATE_POOL_THREE]: /usr/lib/timesync/timesync_progress --identifier “timesync” --progressbaridx “$ID” --mode “$SDW_MODE” --whoami “$who_ami” --progressx 80
2479: dispatching SDWDATE_CURL_DISPATCH_POST[SDWDATE_POOL_THREE] done.
2479: WEB_DATE_FROM_TOOL_STRING_LENGTH: 31
2479: https://www.accessnow.org (took 4s) => diff = -298 second(s)
2479: Results summary: one: 1 | two: 129 | three: -298 | second(s)
2479: Min: -298 | Max: 129 | Median diff: 1 second(s) [1000000000 nanosecond(s)]
2479: local unixtime : 1425247469 | local time : Sun Mar 1 22:04:29 UTC 2015
2479: remote unixtime: 1425247470 | remote time: Sun Mar 1 22:04:30 UTC 2015
2479: sdwdate_terminate_sclockadj: subshell for sclockadj with pid 14538 no longer running. Exit code: 1
2479: sdwdate_terminate_sclockadj: subshell for sclockadj with pid 14538 exited with unexpected non-zero exit code: 1
2479: error_message: ############################################

Error detected! Please report this bug!

BASH_SOURCE: /usr/lib/sdwdate/modules.d/sdwdate

SDW_EXIT_ON_ERROR: 1

SDW_MODE: daemon

SDWDATE_SUBSHELL_SCLOCKADJ_EXIT_CODE: 1

exit_code: 127

error_cause: sdwdate_error_handler signal ERR detected with BASH_COMMAND:

sdwdate_error “$FUNCNAME: subshell for sclockadj exited with unexpected non-zero exit code: $SDWDATE_SUBSHELL_SCLOCKADJ_EXIT_CODE”
################### ||| Shortened log msg string length!
2479: dispatching post_error (SDW_MODE: daemon) (SDW_EXIT_ON_ERROR: 1): /usr/lib/timesync/timesync_post_error --identifier “timesync” --progressbaridx “$ID” --mode “$SDW_MODE” --whoami “$who_ami” “$error_message” & disown
2479: dispatching post_error done.
2479: sdwdate (not timesync!): Error detected. Cleaning up…
2479: sdwdate (not timesync!): signal ERR received. Cleaning up…
2479: sdwdate (not timesync!): signal ERR received. Exiting.
2479: sdwdate (not timesync!): Error detected. Exiting.
2477: Running sdwdate… pid: 2477 | LD_PRELOAD:
2477: sdwdate_preparation: Setting CURL to curl.anondist-orig.
2477: sdwdate_preparation: who_ami is set to user.
2477: dispatching pre (SDW_MODE: startup): /usr/lib/timesync/timesync_pre --autostart --identifier “timesync” --progressbaridx “$ID” --mode “$SDW_MODE” --whoami "$who_ami"
2477: dispatching prerequisite (SDW_MODE: startup) (CURL: curl.anondist-orig) (LD_PRELOAD: ): /usr/lib/anon-shared-helper-scripts/te_pe_tb_check
2477: DISPATCH_PREREQUISITE exited 0, continuing…
2477: allowed_member_failures: 5 (debugging information: temp: 5.10 | SDWDATE_POOL_ONE array_length: 15 | array_length_remember: 0)
2477: dispatching SDWDATE_CURL_DISPATCH_PRE[SDWDATE_POOL_ONE] (SDW_MODE: startup) (CURL: curl.anondist-orig): /usr/lib/timesync/timesync_progress --identifier “timesync” --progressbaridx “$ID” --mode “$SDW_MODE” --whoami “$who_ami” --progressx 15
2477: dispatching SDWDATE_CURL_DISPATCH_PRE[SDWDATE_POOL_ONE] done.
2477: getUrlDateDiff: https://tachanka.org | Tue Mar 3 20:25:08 UTC 2015
2477: dispatching SDWDATE_CURL_DISPATCH_POST[SDWDATE_POOL_ONE]: /usr/lib/timesync/timesync_progress --identifier “timesync” --progressbaridx “$ID” --mode “$SDW_MODE” --whoami “$who_ami” --progressx 30
2477: dispatching SDWDATE_CURL_DISPATCH_POST[SDWDATE_POOL_ONE] done.
2477: WEB_DATE_FROM_TOOL_STRING_LENGTH: 31
2477: https://tachanka.org (took 57s) => diff = 87 second(s)
2477: allowed_member_failures: 6 (debugging information: temp: 5.78 | SDWDATE_POOL_TWO array_length: 17 | array_length_remember: 0)
2477: dispatching SDWDATE_CURL_DISPATCH_PRE[SDWDATE_POOL_TWO] (SDW_MODE: startup) (CURL: curl.anondist-orig): /usr/lib/timesync/timesync_progress --identifier “timesync” --progressbaridx “$ID” --mode “$SDW_MODE” --whoami “$who_ami” --progressx 45
2477: dispatching SDWDATE_CURL_DISPATCH_PRE[SDWDATE_POOL_TWO] done.
2477: getUrlDateDiff: https://www.tarsnap.com | Tue Mar 3 20:25:16 UTC 2015
2477: dispatching SDWDATE_CURL_DISPATCH_POST[SDWDATE_POOL_TWO]: /usr/lib/timesync/timesync_progress --identifier “timesync” --progressbaridx “$ID” --mode “$SDW_MODE” --whoami “$who_ami” --progressx 60
2477: dispatching SDWDATE_CURL_DISPATCH_POST[SDWDATE_POOL_TWO] done.
2477: WEB_DATE_FROM_TOOL_STRING_LENGTH: 31
2477: https://www.tarsnap.com (took 5s) => diff = 222 second(s)
2477: allowed_member_failures: 6 (debugging information: temp: 5.78 | SDWDATE_POOL_THREE array_length: 17 | array_length_remember: 0)
2477: dispatching SDWDATE_CURL_DISPATCH_PRE[SDWDATE_POOL_THREE] (SDW_MODE: startup) (CURL: curl.anondist-orig): /usr/lib/timesync/timesync_progress --identifier “timesync” --progressbaridx “$ID” --mode “$SDW_MODE” --whoami “$who_ami” --progressx 65
2477: dispatching SDWDATE_CURL_DISPATCH_PRE[SDWDATE_POOL_THREE] done.
2477: getUrlDateDiff: https://www.apache.org | Tue Mar 3 20:25:22 UTC 2015
2477: dispatching SDWDATE_CURL_DISPATCH_POST[SDWDATE_POOL_THREE]: /usr/lib/timesync/timesync_progress --identifier “timesync” --progressbaridx “$ID” --mode “$SDW_MODE” --whoami “$who_ami” --progressx 80
2477: dispatching SDWDATE_CURL_DISPATCH_POST[SDWDATE_POOL_THREE] done.
2477: WEB_DATE_FROM_TOOL_STRING_LENGTH: 31
2477: https://www.apache.org (took 4s) => diff = 215 second(s)
2477: Results summary: one: 87 | two: 222 | three: 215 | second(s)
2477: Min: 87 | Max: 222 | Median diff: 215 second(s) [215000000000 nanosecond(s)]
2477: local unixtime : 1425414326 | local time : Tue Mar 3 20:25:26 UTC 2015
2477: remote unixtime: 1425414541 | remote time: Tue Mar 3 20:29:01 UTC 2015
2477: Made up random extra +0.729521883 second[s] [+729521883 nanosecond(s)].
2477: Time before setting: 1425414326.395609665 [Tue Mar 3 20:25:26 UTC 2015]
2477: Setting time using date to 1425414541.729521883…
2477: Time after setting using date: 1425414541.730370082 [Tue Mar 3 20:29:01 UTC 2015]
2477: dispatching post_success (SDW_MODE: startup): /usr/lib/timesync/timesync_post_success --autostart --identifier “timesync” --progressbaridx “$ID” --mode “$SDW_MODE” --whoami "$who_ami"
2477: dispatching post_success done.
2477: Sleeping for 45 minutes. (RANDOMIZE: 1)
2477: sdwdate (not timesync!): signal SIGTERM received. Cleaning up…
2477: sdwdate (not timesync!): signal SIGTERM received. Exiting.
2492: Running sdwdate… pid: 2492 | LD_PRELOAD:
2492: sdwdate_preparation: Setting CURL to curl.anondist-orig.
2492: sdwdate_preparation: who_ami is set to user.
2492: dispatching pre (SDW_MODE: startup): /usr/lib/timesync/timesync_pre --autostart --identifier “timesync” --progressbaridx “$ID” --mode “$SDW_MODE” --whoami "$who_ami"
2492: dispatching prerequisite (SDW_MODE: startup) (CURL: curl.anondist-orig) (LD_PRELOAD: ): /usr/lib/anon-shared-helper-scripts/te_pe_tb_check
2492: DISPATCH_PREREQUISITE exited 0, continuing…
2492: allowed_member_failures: 5 (debugging information: temp: 5.10 | SDWDATE_POOL_ONE array_length: 15 | array_length_remember: 0)
2492: dispatching SDWDATE_CURL_DISPATCH_PRE[SDWDATE_POOL_ONE] (SDW_MODE: startup) (CURL: curl.anondist-orig): /usr/lib/timesync/timesync_progress --identifier “timesync” --progressbaridx “$ID” --mode “$SDW_MODE” --whoami “$who_ami” --progressx 15
2492: dispatching SDWDATE_CURL_DISPATCH_PRE[SDWDATE_POOL_ONE] done.
2492: getUrlDateDiff: https://sarava.org | Sun Mar 8 21:24:42 UTC 2015
2492: dispatching SDWDATE_CURL_DISPATCH_POST[SDWDATE_POOL_ONE]: /usr/lib/timesync/timesync_progress --identifier “timesync” --progressbaridx “$ID” --mode “$SDW_MODE” --whoami “$who_ami” --progressx 30
2492: dispatching SDWDATE_CURL_DISPATCH_POST[SDWDATE_POOL_ONE] done.
2492: WEB_DATE_FROM_TOOL_STRING_LENGTH: 31
2492: https://sarava.org (took 59s) => diff = -26 second(s)
2492: allowed_member_failures: 6 (debugging information: temp: 5.78 | SDWDATE_POOL_TWO array_length: 17 | array_length_remember: 0)
2492: dispatching SDWDATE_CURL_DISPATCH_PRE[SDWDATE_POOL_TWO] (SDW_MODE: startup) (CURL: curl.anondist-orig): /usr/lib/timesync/timesync_progress --identifier “timesync” --progressbaridx “$ID” --mode “$SDW_MODE” --whoami “$who_ami” --progressx 45
2492: dispatching SDWDATE_CURL_DISPATCH_PRE[SDWDATE_POOL_TWO] done.
2492: getUrlDateDiff: https://cve.mitre.org | Sun Mar 8 21:24:49 UTC 2015
2492: dispatching SDWDATE_CURL_DISPATCH_POST[SDWDATE_POOL_TWO]: /usr/lib/timesync/timesync_progress --identifier “timesync” --progressbaridx “$ID” --mode “$SDW_MODE” --whoami “$who_ami” --progressx 60
2492: dispatching SDWDATE_CURL_DISPATCH_POST[SDWDATE_POOL_TWO] done.
2492: WEB_DATE_FROM_TOOL_STRING_LENGTH: 31
2492: https://cve.mitre.org (took 5s) => diff = -248 second(s)
2492: allowed_member_failures: 6 (debugging information: temp: 5.78 | SDWDATE_POOL_THREE array_length: 17 | array_length_remember: 0)
2492: dispatching SDWDATE_CURL_DISPATCH_PRE[SDWDATE_POOL_THREE] (SDW_MODE: startup) (CURL: curl.anondist-orig): /usr/lib/timesync/timesync_progress --identifier “timesync” --progressbaridx “$ID” --mode “$SDW_MODE” --whoami “$who_ami” --progressx 65
2492: dispatching SDWDATE_CURL_DISPATCH_PRE[SDWDATE_POOL_THREE] done.
2492: getUrlDateDiff: https://www.piratenpartei.de | Sun Mar 8 21:24:55 UTC 2015
2492: dispatching SDWDATE_CURL_DISPATCH_POST[SDWDATE_POOL_THREE]: /usr/lib/timesync/timesync_progress --identifier “timesync” --progressbaridx “$ID” --mode “$SDW_MODE” --whoami “$who_ami” --progressx 80
2492: dispatching SDWDATE_CURL_DISPATCH_POST[SDWDATE_POOL_THREE] done.
2492: WEB_DATE_FROM_TOOL_STRING_LENGTH: 31
2492: https://www.piratenpartei.de (took 5s) => diff = -82 second(s)
2492: Results summary: one: -26 | two: -248 | three: -82 | second(s)
2492: Min: -248 | Max: -26 | Median diff: -82 second(s) [-82000000000 nanosecond(s)]
2492: local unixtime : 1425849900 | local time : Sun Mar 8 21:25:00 UTC 2015
2492: remote unixtime: 1425849818 | remote time: Sun Mar 8 21:23:38 UTC 2015
2492: Made up random extra -0.402262339 second[s] [-402262339 nanosecond(s)].
2492: Time before setting: 1425849900.302529281 [Sun Mar 8 21:25:00 UTC 2015]
2492: Setting time using date to 1425849817.597737661…
2492: Time after setting using date: 1425849817.598701306 [Sun Mar 8 21:23:37 UTC 2015]
2492: dispatching post_success (SDW_MODE: startup): /usr/lib/timesync/timesync_post_success --autostart --identifier “timesync” --progressbaridx “$ID” --mode “$SDW_MODE” --whoami "$who_ami"
2492: dispatching post_success done.
2492: Sleeping for 52 minutes. (RANDOMIZE: 1)
2492: sdwdate (not timesync!): signal SIGTERM received. Cleaning up…
2492: sdwdate (not timesync!): signal SIGTERM received. Exiting.
2459: Running sdwdate… pid: 2459 | LD_PRELOAD:
2459: sdwdate_preparation: Setting CURL to curl.anondist-orig.
2459: sdwdate_preparation: who_ami is set to user.
2459: dispatching pre (SDW_MODE: startup): /usr/lib/timesync/timesync_pre --autostart --identifier “timesync” --progressbaridx “$ID” --mode “$SDW_MODE” --whoami "$who_ami"
2459: dispatching prerequisite (SDW_MODE: startup) (CURL: curl.anondist-orig) (LD_PRELOAD: ): /usr/lib/anon-shared-helper-scripts/te_pe_tb_check
2459: DISPATCH_PREREQUISITE exited 0, continuing…
2459: allowed_member_failures: 5 (debugging information: temp: 5.10 | SDWDATE_POOL_ONE array_length: 15 | array_length_remember: 0)
2459: dispatching SDWDATE_CURL_DISPATCH_PRE[SDWDATE_POOL_ONE] (SDW_MODE: startup) (CURL: curl.anondist-orig): /usr/lib/timesync/timesync_progress --identifier “timesync” --progressbaridx “$ID” --mode “$SDW_MODE” --whoami “$who_ami” --progressx 15
2459: dispatching SDWDATE_CURL_DISPATCH_PRE[SDWDATE_POOL_ONE] done.
2459: getUrlDateDiff: https://chavez.indymedia.org | Mon Mar 9 17:13:46 UTC 2015
2459: No file could be downloaded from https://chavez.indymedia.org. (took 61s) (curl_exit_code: 7 | curl_status_message: [7] - [Failed to connect to host.])
2459: allowed_member_failures: 5 (debugging information: temp: 5.10 | SDWDATE_POOL_ONE array_length: 15 | array_length_remember: 1)
2459: dispatching SDWDATE_CURL_DISPATCH_PRE[SDWDATE_POOL_ONE] (SDW_MODE: startup) (CURL: curl.anondist-orig): /usr/lib/timesync/timesync_progress --identifier “timesync” --progressbaridx “$ID” --mode “$SDW_MODE” --whoami “$who_ami” --progressx 15
2459: dispatching SDWDATE_CURL_DISPATCH_PRE[SDWDATE_POOL_ONE] done.
2459: getUrlDateDiff: https://www.torproject.org | Mon Mar 9 17:13:49 UTC 2015
2459: dispatching SDWDATE_CURL_DISPATCH_POST[SDWDATE_POOL_ONE]: /usr/lib/timesync/timesync_progress --identifier “timesync” --progressbaridx “$ID” --mode “$SDW_MODE” --whoami “$who_ami” --progressx 30
2459: dispatching SDWDATE_CURL_DISPATCH_POST[SDWDATE_POOL_ONE] done.
2459: WEB_DATE_FROM_TOOL_STRING_LENGTH: 31
2459: https://www.torproject.org (took 3s) => diff = 62 second(s)
2459: allowed_member_failures: 6 (debugging information: temp: 5.78 | SDWDATE_POOL_TWO array_length: 17 | array_length_remember: 0)
2459: dispatching SDWDATE_CURL_DISPATCH_PRE[SDWDATE_POOL_TWO] (SDW_MODE: startup) (CURL: curl.anondist-orig): /usr/lib/timesync/timesync_progress --identifier “timesync” --progressbaridx “$ID” --mode “$SDW_MODE” --whoami “$who_ami” --progressx 45
2459: dispatching SDWDATE_CURL_DISPATCH_PRE[SDWDATE_POOL_TWO] done.
2459: getUrlDateDiff: https://pressfreedomfoundation.org | Mon Mar 9 17:13:52 UTC 2015
2459: dispatching SDWDATE_CURL_DISPATCH_POST[SDWDATE_POOL_TWO]: /usr/lib/timesync/timesync_progress --identifier “timesync” --progressbaridx “$ID” --mode “$SDW_MODE” --whoami “$who_ami” --progressx 60
2459: dispatching SDWDATE_CURL_DISPATCH_POST[SDWDATE_POOL_TWO] done.
2459: WEB_DATE_FROM_TOOL_STRING_LENGTH: 31
2459: https://pressfreedomfoundation.org (took 2s) => diff = 64 second(s)
2459: allowed_member_failures: 6 (debugging information: temp: 5.78 | SDWDATE_POOL_THREE array_length: 17 | array_length_remember: 0)
2459: dispatching SDWDATE_CURL_DISPATCH_PRE[SDWDATE_POOL_THREE] (SDW_MODE: startup) (CURL: curl.anondist-orig): /usr/lib/timesync/timesync_progress --identifier “timesync” --progressbaridx “$ID” --mode “$SDW_MODE” --whoami “$who_ami” --progressx 65
2459: dispatching SDWDATE_CURL_DISPATCH_PRE[SDWDATE_POOL_THREE] done.
2459: getUrlDateDiff: https://schneier.com | Mon Mar 9 17:13:55 UTC 2015
2459: dispatching SDWDATE_CURL_DISPATCH_POST[SDWDATE_POOL_THREE]: /usr/lib/timesync/timesync_progress --identifier “timesync” --progressbaridx “$ID” --mode “$SDW_MODE” --whoami “$who_ami” --progressx 80
2459: dispatching SDWDATE_CURL_DISPATCH_POST[SDWDATE_POOL_THREE] done.
2459: WEB_DATE_FROM_TOOL_STRING_LENGTH: 31
2459: https://schneier.com (took 4s) => diff = 64 second(s)
2459: Results summary: one: 62 | two: 64 | three: 64 | second(s)
2459: Min: 62 | Max: 64 | Median diff: 64 second(s) [64000000000 nanosecond(s)]
2459: local unixtime : 1425921239 | local time : Mon Mar 9 17:13:59 UTC 2015
2459: remote unixtime: 1425921303 | remote time: Mon Mar 9 17:15:03 UTC 2015
2459: Made up random extra +0.583966757 second[s] [+583966757 nanosecond(s)].
2459: Time before setting: 1425921239.803221836 [Mon Mar 9 17:13:59 UTC 2015]
2459: Setting time using date to 1425921303.583966757…
2459: Time after setting using date: 1425921303.584763710 [Mon Mar 9 17:15:03 UTC 2015]
2459: dispatching post_success (SDW_MODE: startup): /usr/lib/timesync/timesync_post_success --autostart --identifier “timesync” --progressbaridx “$ID” --mode “$SDW_MODE” --whoami "$who_ami"
2459: dispatching post_success done.
2459: Sleeping for 11 minutes. (RANDOMIZE: 1)
2459: Running sdwdate… pid: 2459 | LD_PRELOAD:
2459: sdwdate_preparation: Setting CURL to curl.anondist-orig.
2459: sdwdate_preparation: who_ami is set to user.
2459: dispatching pre (SDW_MODE: daemon): /usr/lib/timesync/timesync_pre --autostart --identifier “timesync” --progressbaridx “$ID” --mode “$SDW_MODE” --whoami "$who_ami"
2459: dispatching prerequisite (SDW_MODE: daemon) (CURL: curl.anondist-orig) (LD_PRELOAD: ): /usr/lib/anon-shared-helper-scripts/te_pe_tb_check
2459: DISPATCH_PREREQUISITE exited 0, continuing…
2459: allowed_member_failures: 5 (debugging information: temp: 5.10 | SDWDATE_POOL_ONE array_length: 15 | array_length_remember: 0)
2459: dispatching SDWDATE_CURL_DISPATCH_PRE[SDWDATE_POOL_ONE] (SDW_MODE: daemon) (CURL: curl.anondist-orig): /usr/lib/timesync/timesync_progress --identifier “timesync” --progressbaridx “$ID” --mode “$SDW_MODE” --whoami “$who_ami” --progressx 15
2459: dispatching SDWDATE_CURL_DISPATCH_PRE[SDWDATE_POOL_ONE] done.
2459: getUrlDateDiff: https://www.eff.org | Mon Mar 9 17:26:06 UTC 2015
2459: dispatching SDWDATE_CURL_DISPATCH_POST[SDWDATE_POOL_ONE]: /usr/lib/timesync/timesync_progress --identifier “timesync” --progressbaridx “$ID” --mode “$SDW_MODE” --whoami “$who_ami” --progressx 30
2459: dispatching SDWDATE_CURL_DISPATCH_POST[SDWDATE_POOL_ONE] done.
2459: WEB_DATE_FROM_TOOL_STRING_LENGTH: 31
2459: https://www.eff.org (took 6s) => diff = 0 second(s)
2459: allowed_member_failures: 6 (debugging information: temp: 5.78 | SDWDATE_POOL_TWO array_length: 17 | array_length_remember: 0)
2459: dispatching SDWDATE_CURL_DISPATCH_PRE[SDWDATE_POOL_TWO] (SDW_MODE: daemon) (CURL: curl.anondist-orig): /usr/lib/timesync/timesync_progress --identifier “timesync” --progressbaridx “$ID” --mode “$SDW_MODE” --whoami “$who_ami” --progressx 45
2459: dispatching SDWDATE_CURL_DISPATCH_PRE[SDWDATE_POOL_TWO] done.
2459: getUrlDateDiff: https://cve.mitre.org | Mon Mar 9 17:26:12 UTC 2015
2459: dispatching SDWDATE_CURL_DISPATCH_POST[SDWDATE_POOL_TWO]: /usr/lib/timesync/timesync_progress --identifier “timesync” --progressbaridx “$ID” --mode “$SDW_MODE” --whoami “$who_ami” --progressx 60
2459: dispatching SDWDATE_CURL_DISPATCH_POST[SDWDATE_POOL_TWO] done.
2459: WEB_DATE_FROM_TOOL_STRING_LENGTH: 31
2459: https://cve.mitre.org (took 3s) => diff = -226 second(s)
2459: allowed_member_failures: 6 (debugging information: temp: 5.78 | SDWDATE_POOL_THREE array_length: 17 | array_length_remember: 0)
2459: dispatching SDWDATE_CURL_DISPATCH_PRE[SDWDATE_POOL_THREE] (SDW_MODE: daemon) (CURL: curl.anondist-orig): /usr/lib/timesync/timesync_progress --identifier “timesync” --progressbaridx “$ID” --mode “$SDW_MODE” --whoami “$who_ami” --progressx 65
2459: dispatching SDWDATE_CURL_DISPATCH_PRE[SDWDATE_POOL_THREE] done.
2459: getUrlDateDiff: https://privacyfoundation.ch | Mon Mar 9 17:26:15 UTC 2015
2459: dispatching SDWDATE_CURL_DISPATCH_POST[SDWDATE_POOL_THREE]: /usr/lib/timesync/timesync_progress --identifier “timesync” --progressbaridx “$ID” --mode “$SDW_MODE” --whoami “$who_ami” --progressx 80
2459: dispatching SDWDATE_CURL_DISPATCH_POST[SDWDATE_POOL_THREE] done.
2459: WEB_DATE_FROM_TOOL_STRING_LENGTH: 31
2459: https://privacyfoundation.ch (took 3s) => diff = 0 second(s)
2459: Results summary: one: 0 | two: -226 | three: 0 | second(s)
2459: Min: -226 | Max: 0 | Median diff: 0 second(s) [0 nanosecond(s)]
2459: local unixtime : 1425921979 | local time : Mon Mar 9 17:26:19 UTC 2015
2459: remote unixtime: 1425921979 | remote time: Mon Mar 9 17:26:19 UTC 2015
2459: No need to set clock.
2459: dispatching post_success (SDW_MODE: daemon): /usr/lib/timesync/timesync_post_success --autostart --identifier “timesync” --progressbaridx “$ID” --mode “$SDW_MODE” --whoami "$who_ami"
2459: dispatching post_success done.
2459: Sleeping for 37 minutes. (RANDOMIZE: 1)
2459: Running sdwdate… pid: 2459 | LD_PRELOAD:
2459: sdwdate_preparation: Setting CURL to curl.anondist-orig.
2459: sdwdate_preparation: who_ami is set to user.
2459: dispatching pre (SDW_MODE: daemon): /usr/lib/timesync/timesync_pre --autostart --identifier “timesync” --progressbaridx “$ID” --mode “$SDW_MODE” --whoami "$who_ami"
2459: dispatching prerequisite (SDW_MODE: daemon) (CURL: curl.anondist-orig) (LD_PRELOAD: ): /usr/lib/anon-shared-helper-scripts/te_pe_tb_check
2459: DISPATCH_PREREQUISITE exited 0, continuing…
2459: allowed_member_failures: 5 (debugging information: temp: 5.10 | SDWDATE_POOL_ONE array_length: 15 | array_length_remember: 0)
2459: dispatching SDWDATE_CURL_DISPATCH_PRE[SDWDATE_POOL_ONE] (SDW_MODE: daemon) (CURL: curl.anondist-orig): /usr/lib/timesync/timesync_progress --identifier “timesync” --progressbaridx “$ID” --mode “$SDW_MODE” --whoami “$who_ami” --progressx 15
2459: dispatching SDWDATE_CURL_DISPATCH_PRE[SDWDATE_POOL_ONE] done.
2459: getUrlDateDiff: https://www.immerda.ch | Mon Mar 9 18:03:22 UTC 2015
2459: dispatching SDWDATE_CURL_DISPATCH_POST[SDWDATE_POOL_ONE]: /usr/lib/timesync/timesync_progress --identifier “timesync” --progressbaridx “$ID” --mode “$SDW_MODE” --whoami “$who_ami” --progressx 30
2459: dispatching SDWDATE_CURL_DISPATCH_POST[SDWDATE_POOL_ONE] done.
2459: WEB_DATE_FROM_TOOL_STRING_LENGTH: 31
2459: https://www.immerda.ch (took 4s) => diff = 0 second(s)
2459: allowed_member_failures: 6 (debugging information: temp: 5.78 | SDWDATE_POOL_TWO array_length: 17 | array_length_remember: 0)
2459: dispatching SDWDATE_CURL_DISPATCH_PRE[SDWDATE_POOL_TWO] (SDW_MODE: daemon) (CURL: curl.anondist-orig): /usr/lib/timesync/timesync_progress --identifier “timesync” --progressbaridx “$ID” --mode “$SDW_MODE” --whoami “$who_ami” --progressx 45
2459: dispatching SDWDATE_CURL_DISPATCH_PRE[SDWDATE_POOL_TWO] done.
2459: getUrlDateDiff: https://www.tarsnap.com | Mon Mar 9 18:03:27 UTC 2015
2459: dispatching SDWDATE_CURL_DISPATCH_POST[SDWDATE_POOL_TWO]: /usr/lib/timesync/timesync_progress --identifier “timesync” --progressbaridx “$ID” --mode “$SDW_MODE” --whoami “$who_ami” --progressx 60
2459: dispatching SDWDATE_CURL_DISPATCH_POST[SDWDATE_POOL_TWO] done.
2459: WEB_DATE_FROM_TOOL_STRING_LENGTH: 31
2459: https://www.tarsnap.com (took 4s) => diff = 142 second(s)
2459: allowed_member_failures: 6 (debugging information: temp: 5.78 | SDWDATE_POOL_THREE array_length: 17 | array_length_remember: 0)
2459: dispatching SDWDATE_CURL_DISPATCH_PRE[SDWDATE_POOL_THREE] (SDW_MODE: daemon) (CURL: curl.anondist-orig): /usr/lib/timesync/timesync_progress --identifier “timesync” --progressbaridx “$ID” --mode “$SDW_MODE” --whoami “$who_ami” --progressx 65
2459: dispatching SDWDATE_CURL_DISPATCH_PRE[SDWDATE_POOL_THREE] done.
2459: getUrlDateDiff: https://www.wauland.de | Mon Mar 9 18:03:31 UTC 2015
2459: No file could be downloaded from https://www.wauland.de. (took 3s) (curl_exit_code: 60 | curl_status_message: [60] - [Peer certificate cannot be authenticated with known CA certificates.] - Is your clock much too slow or fast by chance?)
2459: allowed_member_failures: 6 (debugging information: temp: 5.78 | SDWDATE_POOL_THREE array_length: 17 | array_length_remember: 1)
2459: dispatching SDWDATE_CURL_DISPATCH_PRE[SDWDATE_POOL_THREE] (SDW_MODE: daemon) (CURL: curl.anondist-orig): /usr/lib/timesync/timesync_progress --identifier “timesync” --progressbaridx “$ID” --mode “$SDW_MODE” --whoami “$who_ami” --progressx 65
2459: dispatching SDWDATE_CURL_DISPATCH_PRE[SDWDATE_POOL_THREE] done.
2459: getUrlDateDiff: https://www.calyxinstitute.org | Mon Mar 9 18:03:34 UTC 2015
2459: dispatching SDWDATE_CURL_DISPATCH_POST[SDWDATE_POOL_THREE]: /usr/lib/timesync/timesync_progress --identifier “timesync” --progressbaridx “$ID” --mode “$SDW_MODE” --whoami “$who_ami” --progressx 80
2459: dispatching SDWDATE_CURL_DISPATCH_POST[SDWDATE_POOL_THREE] done.
2459: WEB_DATE_FROM_TOOL_STRING_LENGTH: 31
2459: https://www.calyxinstitute.org (took 5s) => diff = 0 second(s)
2459: Results summary: one: 0 | two: 142 | three: 0 | second(s)
2459: Min: 0 | Max: 142 | Median diff: 0 second(s) [0 nanosecond(s)]
2459: local unixtime : 1425924218 | local time : Mon Mar 9 18:03:38 UTC 2015
2459: remote unixtime: 1425924218 | remote time: Mon Mar 9 18:03:38 UTC 2015
2459: No need to set clock.
2459: dispatching post_success (SDW_MODE: daemon): /usr/lib/timesync/timesync_post_success --autostart --identifier “timesync” --progressbaridx “$ID” --mode “$SDW_MODE” --whoami "$who_ami"
2459: dispatching post_success done.
2459: Sleeping for 25 minutes. (RANDOMIZE: 1)
2459: Running sdwdate… pid: 2459 | LD_PRELOAD:
2459: sdwdate_preparation: Setting CURL to curl.anondist-orig.
2459: sdwdate_preparation: who_ami is set to user.
2459: dispatching pre (SDW_MODE: daemon): /usr/lib/timesync/timesync_pre --autostart --identifier “timesync” --progressbaridx “$ID” --mode “$SDW_MODE” --whoami "$who_ami"
2459: dispatching prerequisite (SDW_MODE: daemon) (CURL: curl.anondist-orig) (LD_PRELOAD: ): /usr/lib/anon-shared-helper-scripts/te_pe_tb_check
2459: DISPATCH_PREREQUISITE exited 0, continuing…
2459: allowed_member_failures: 5 (debugging information: temp: 5.10 | SDWDATE_POOL_ONE array_length: 15 | array_length_remember: 0)
2459: dispatching SDWDATE_CURL_DISPATCH_PRE[SDWDATE_POOL_ONE] (SDW_MODE: daemon) (CURL: curl.anondist-orig): /usr/lib/timesync/timesync_progress --identifier “timesync” --progressbaridx “$ID” --mode “$SDW_MODE” --whoami “$who_ami” --progressx 15
2459: dispatching SDWDATE_CURL_DISPATCH_PRE[SDWDATE_POOL_ONE] done.
2459: getUrlDateDiff: https://boum.org | Mon Mar 9 18:28:42 UTC 2015
2459: dispatching SDWDATE_CURL_DISPATCH_POST[SDWDATE_POOL_ONE]: /usr/lib/timesync/timesync_progress --identifier “timesync” --progressbaridx “$ID” --mode “$SDW_MODE” --whoami “$who_ami” --progressx 30
2459: dispatching SDWDATE_CURL_DISPATCH_POST[SDWDATE_POOL_ONE] done.
2459: WEB_DATE_FROM_TOOL_STRING_LENGTH: 31
2459: https://boum.org (took 4s) => diff = -2 second(s)
2459: allowed_member_failures: 6 (debugging information: temp: 5.78 | SDWDATE_POOL_TWO array_length: 17 | array_length_remember: 0)
2459: dispatching SDWDATE_CURL_DISPATCH_PRE[SDWDATE_POOL_TWO] (SDW_MODE: daemon) (CURL: curl.anondist-orig): /usr/lib/timesync/timesync_progress --identifier “timesync” --progressbaridx “$ID” --mode “$SDW_MODE” --whoami “$who_ami” --progressx 45
2459: dispatching SDWDATE_CURL_DISPATCH_PRE[SDWDATE_POOL_TWO] done.
2459: getUrlDateDiff: https://www.kernel.org | Mon Mar 9 18:28:47 UTC 2015
2459: dispatching SDWDATE_CURL_DISPATCH_POST[SDWDATE_POOL_TWO]: /usr/lib/timesync/timesync_progress --identifier “timesync” --progressbaridx “$ID” --mode “$SDW_MODE” --whoami “$who_ami” --progressx 60
2459: dispatching SDWDATE_CURL_DISPATCH_POST[SDWDATE_POOL_TWO] done.
2459: WEB_DATE_FROM_TOOL_STRING_LENGTH: 31
2459: https://www.kernel.org (took 3s) => diff = 0 second(s)
2459: allowed_member_failures: 6 (debugging information: temp: 5.78 | SDWDATE_POOL_THREE array_length: 17 | array_length_remember: 0)
2459: dispatching SDWDATE_CURL_DISPATCH_PRE[SDWDATE_POOL_THREE] (SDW_MODE: daemon) (CURL: curl.anondist-orig): /usr/lib/timesync/timesync_progress --identifier “timesync” --progressbaridx “$ID” --mode “$SDW_MODE” --whoami “$who_ami” --progressx 65
2459: dispatching SDWDATE_CURL_DISPATCH_PRE[SDWDATE_POOL_THREE] done.
2459: getUrlDateDiff: https://en.bitcoin.it | Mon Mar 9 18:28:51 UTC 2015
2459: dispatching SDWDATE_CURL_DISPATCH_POST[SDWDATE_POOL_THREE]: /usr/lib/timesync/timesync_progress --identifier “timesync” --progressbaridx “$ID” --mode “$SDW_MODE” --whoami “$who_ami” --progressx 80
2459: dispatching SDWDATE_CURL_DISPATCH_POST[SDWDATE_POOL_THREE] done.
2459: WEB_DATE_FROM_TOOL_STRING_LENGTH: 31
2459: https://en.bitcoin.it (took 3s) => diff = 0 second(s)
2459: Results summary: one: -2 | two: 0 | three: 0 | second(s)
2459: Min: -2 | Max: 0 | Median diff: 0 second(s) [0 nanosecond(s)]
2459: local unixtime : 1425925734 | local time : Mon Mar 9 18:28:54 UTC 2015
2459: remote unixtime: 1425925734 | remote time: Mon Mar 9 18:28:54 UTC 2015
2459: No need to set clock.
2459: dispatching post_success (SDW_MODE: daemon): /usr/lib/timesync/timesync_post_success --autostart --identifier “timesync” --progressbaridx “$ID” --mode “$SDW_MODE” --whoami "$who_ami"
2459: dispatching post_success done.
2459: Sleeping for 17 minutes. (RANDOMIZE: 1)
2459: Running sdwdate… pid: 2459 | LD_PRELOAD:
2459: sdwdate_preparation: Setting CURL to curl.anondist-orig.
2459: sdwdate_preparation: who_ami is set to user.
2459: dispatching pre (SDW_MODE: daemon): /usr/lib/timesync/timesync_pre --autostart --identifier “timesync” --progressbaridx “$ID” --mode “$SDW_MODE” --whoami "$who_ami"
2459: dispatching prerequisite (SDW_MODE: daemon) (CURL: curl.anondist-orig) (LD_PRELOAD: ): /usr/lib/anon-shared-helper-scripts/te_pe_tb_check
2459: DISPATCH_PREREQUISITE exited 0, continuing…
2459: allowed_member_failures: 5 (debugging information: temp: 5.10 | SDWDATE_POOL_ONE array_length: 15 | array_length_remember: 0)
2459: dispatching SDWDATE_CURL_DISPATCH_PRE[SDWDATE_POOL_ONE] (SDW_MODE: daemon) (CURL: curl.anondist-orig): /usr/lib/timesync/timesync_progress --identifier “timesync” --progressbaridx “$ID” --mode “$SDW_MODE” --whoami “$who_ami” --progressx 15
2459: dispatching SDWDATE_CURL_DISPATCH_PRE[SDWDATE_POOL_ONE] done.
2459: getUrlDateDiff: https://www.torproject.org | Mon Mar 9 18:45:57 UTC 2015
2459: dispatching SDWDATE_CURL_DISPATCH_POST[SDWDATE_POOL_ONE]: /usr/lib/timesync/timesync_progress --identifier “timesync” --progressbaridx “$ID” --mode “$SDW_MODE” --whoami “$who_ami” --progressx 30
2459: dispatching SDWDATE_CURL_DISPATCH_POST[SDWDATE_POOL_ONE] done.
2459: WEB_DATE_FROM_TOOL_STRING_LENGTH: 31
2459: https://www.torproject.org (took 2s) => diff = 1 second(s)
2459: allowed_member_failures: 6 (debugging information: temp: 5.78 | SDWDATE_POOL_TWO array_length: 17 | array_length_remember: 0)
2459: dispatching SDWDATE_CURL_DISPATCH_PRE[SDWDATE_POOL_TWO] (SDW_MODE: daemon) (CURL: curl.anondist-orig): /usr/lib/timesync/timesync_progress --identifier “timesync” --progressbaridx “$ID” --mode “$SDW_MODE” --whoami “$who_ami” --progressx 45
2459: dispatching SDWDATE_CURL_DISPATCH_PRE[SDWDATE_POOL_TWO] done.
2459: getUrlDateDiff: https://www.kernel.org | Mon Mar 9 18:45:59 UTC 2015
2459: dispatching SDWDATE_CURL_DISPATCH_POST[SDWDATE_POOL_TWO]: /usr/lib/timesync/timesync_progress --identifier “timesync” --progressbaridx “$ID” --mode “$SDW_MODE” --whoami “$who_ami” --progressx 60
2459: dispatching SDWDATE_CURL_DISPATCH_POST[SDWDATE_POOL_TWO] done.
2459: WEB_DATE_FROM_TOOL_STRING_LENGTH: 31
2459: https://www.kernel.org (took 3s) => diff = 1 second(s)
2459: allowed_member_failures: 6 (debugging information: temp: 5.78 | SDWDATE_POOL_THREE array_length: 17 | array_length_remember: 0)
2459: dispatching SDWDATE_CURL_DISPATCH_PRE[SDWDATE_POOL_THREE] (SDW_MODE: daemon) (CURL: curl.anondist-orig): /usr/lib/timesync/timesync_progress --identifier “timesync” --progressbaridx “$ID” --mode “$SDW_MODE” --whoami “$who_ami” --progressx 65
2459: dispatching SDWDATE_CURL_DISPATCH_PRE[SDWDATE_POOL_THREE] done.
2459: getUrlDateDiff: https://www.torservers.net | Mon Mar 9 18:46:02 UTC 2015
2459: dispatching SDWDATE_CURL_DISPATCH_POST[SDWDATE_POOL_THREE]: /usr/lib/timesync/timesync_progress --identifier “timesync” --progressbaridx “$ID” --mode “$SDW_MODE” --whoami “$who_ami” --progressx 80
2459: dispatching SDWDATE_CURL_DISPATCH_POST[SDWDATE_POOL_THREE] done.
2459: WEB_DATE_FROM_TOOL_STRING_LENGTH: 31
2459: https://www.torservers.net (took 5s) => diff = 0 second(s)
2459: Results summary: one: 1 | two: 1 | three: 0 | second(s)
2459: Min: 0 | Max: 1 | Median diff: 1 second(s) [1000000000 nanosecond(s)]
2459: local unixtime : 1425926767 | local time : Mon Mar 9 18:46:07 UTC 2015
2459: remote unixtime: 1425926768 | remote time: Mon Mar 9 18:46:08 UTC 2015
2459: Made up random extra +0.251084028 second[s] [+251084028 nanosecond(s)].
2459: Launching into background: sudo INLINEDIR=/var/cache/sdwdate/sclockadj /usr/lib/sdwdate/sclockadj --no-verbose --no-debug --no-first-wait --move-min 500000 --move-max 500000 --wait-min 1000000000 --wait-max 1000000000 --add 1251084028
2459: Started subshell for sclockadj with pid: 23268
2459: sdwdate_subshell_read: start
2459: dispatching post_success (SDW_MODE: daemon): /usr/lib/timesync/timesync_post_success --autostart --identifier “timesync” --progressbaridx “$ID” --mode “$SDW_MODE” --whoami "$who_ami"
2459: sdwdate_subshell_read: sclockadj reports: sudo: unable to execute /usr/lib/sdwdate/sclockadj_debug_helper: Permission denied
2459: sdwdate_subshell_read: sclockadj reports: Time before running sclockadj: 1425926767.469582802 [Mon Mar 9 18:46:07 UTC 2015]
2459: sdwdate_subshell_read: sclockadj reports: sdwdate_subshell_wait: Waiting for pid to finish SDWDATE_SCLOCKADJ_COMMAND_PID: 23284
2459: sdwdate_subshell_read: sclockadj reports: /usr/lib/ruby/1.9.1/fileutils.rb:244:in mkdir': Permission denied - /var/cache/sdwdate/sclockadj/.ruby_inline (Errno::EACCES) 2459: sdwdate_subshell_read: sclockadj reports: from /usr/lib/ruby/1.9.1/fileutils.rb:244:infu_mkdir’
2459: sdwdate_subshell_read: sclockadj reports: from /usr/lib/ruby/1.9.1/fileutils.rb:221:in block (2 levels) in mkdir_p' 2459: sdwdate_subshell_read: sclockadj reports: from /usr/lib/ruby/1.9.1/fileutils.rb:219:inreverse_each’
2459: sdwdate_subshell_read: sclockadj reports: from /usr/lib/ruby/1.9.1/fileutils.rb:219:in block in mkdir_p' 2459: sdwdate_subshell_read: sclockadj reports: from /usr/lib/ruby/1.9.1/fileutils.rb:205:ineach’
2459: sdwdate_subshell_read: sclockadj reports: from /usr/lib/ruby/1.9.1/fileutils.rb:205:in mkdir_p' 2459: sdwdate_subshell_read: sclockadj reports: from /usr/lib/ruby/vendor_ruby/inline.rb:544:inbuild’
2459: sdwdate_subshell_read: sclockadj reports: from /usr/lib/ruby/vendor_ruby/inline.rb:843:in inline' 2459: sdwdate_subshell_read: sclockadj reports: from /usr/lib/sdwdate/sclockadj:189:inclass:Cinline
2459: sdwdate_subshell_read: sclockadj reports: from /usr/lib/sdwdate/sclockadj:187:in `'
2459: sdwdate_subshell_read: sclockadj reports: sdwdate_subshell_wait: SDWDATE_SCLOCKADJ_COMMAND_PID: 23284 | SDWDATE_SCLOCKADJ_COMMAND_EXIT_CODE: 1
2459: sdwdate_subshell_read: sclockadj reports: was running for 0 s [~ 0.00 min] [~ 0.00 h].
2459: sdwdate_subshell_read: sclockadj reports: Time after running sclockadj: 1425926767.993905383 [Mon Mar 9 18:46:07 UTC 2015]
2459: sdwdate_subshell_read: sclockadj reports: exit code: 1
2459: sdwdate_subshell_read: end
2459: dispatching post_success done.
2459: Sleeping for 27 minutes. (RANDOMIZE: 1)
2459: Running sdwdate… pid: 2459 | LD_PRELOAD:
2459: sdwdate_preparation: Setting CURL to curl.anondist-orig.
2459: sdwdate_preparation: who_ami is set to user.
2459: dispatching pre (SDW_MODE: daemon): /usr/lib/timesync/timesync_pre --autostart --identifier “timesync” --progressbaridx “$ID” --mode “$SDW_MODE” --whoami "$who_ami"
2459: dispatching prerequisite (SDW_MODE: daemon) (CURL: curl.anondist-orig) (LD_PRELOAD: ): /usr/lib/anon-shared-helper-scripts/te_pe_tb_check
2459: DISPATCH_PREREQUISITE exited 0, continuing…
2459: allowed_member_failures: 5 (debugging information: temp: 5.10 | SDWDATE_POOL_ONE array_length: 15 | array_length_remember: 0)
2459: dispatching SDWDATE_CURL_DISPATCH_PRE[SDWDATE_POOL_ONE] (SDW_MODE: daemon) (CURL: curl.anondist-orig): /usr/lib/timesync/timesync_progress --identifier “timesync” --progressbaridx “$ID” --mode “$SDW_MODE” --whoami “$who_ami” --progressx 15
2459: dispatching SDWDATE_CURL_DISPATCH_PRE[SDWDATE_POOL_ONE] done.
2459: getUrlDateDiff: https://www.1984.is | Mon Mar 9 19:13:10 UTC 2015
2459: dispatching SDWDATE_CURL_DISPATCH_POST[SDWDATE_POOL_ONE]: /usr/lib/timesync/timesync_progress --identifier “timesync” --progressbaridx “$ID” --mode “$SDW_MODE” --whoami “$who_ami” --progressx 30
2459: dispatching SDWDATE_CURL_DISPATCH_POST[SDWDATE_POOL_ONE] done.
2459: WEB_DATE_FROM_TOOL_STRING_LENGTH: 31
2459: https://www.1984.is (took 3s) => diff = 0 second(s)
2459: allowed_member_failures: 6 (debugging information: temp: 5.78 | SDWDATE_POOL_TWO array_length: 17 | array_length_remember: 0)
2459: dispatching SDWDATE_CURL_DISPATCH_PRE[SDWDATE_POOL_TWO] (SDW_MODE: daemon) (CURL: curl.anondist-orig): /usr/lib/timesync/timesync_progress --identifier “timesync” --progressbaridx “$ID” --mode “$SDW_MODE” --whoami “$who_ami” --progressx 45
2459: dispatching SDWDATE_CURL_DISPATCH_PRE[SDWDATE_POOL_TWO] done.
2459: getUrlDateDiff: https://pressfreedomfoundation.org | Mon Mar 9 19:13:14 UTC 2015
2459: dispatching SDWDATE_CURL_DISPATCH_POST[SDWDATE_POOL_TWO]: /usr/lib/timesync/timesync_progress --identifier “timesync” --progressbaridx “$ID” --mode “$SDW_MODE” --whoami “$who_ami” --progressx 60
2459: dispatching SDWDATE_CURL_DISPATCH_POST[SDWDATE_POOL_TWO] done.
2459: WEB_DATE_FROM_TOOL_STRING_LENGTH: 31
2459: https://pressfreedomfoundation.org (took 3s) => diff = 0 second(s)
2459: allowed_member_failures: 6 (debugging information: temp: 5.78 | SDWDATE_POOL_THREE array_length: 17 | array_length_remember: 0)
2459: dispatching SDWDATE_CURL_DISPATCH_PRE[SDWDATE_POOL_THREE] (SDW_MODE: daemon) (CURL: curl.anondist-orig): /usr/lib/timesync/timesync_progress --identifier “timesync” --progressbaridx “$ID” --mode “$SDW_MODE” --whoami “$who_ami” --progressx 65
2459: dispatching SDWDATE_CURL_DISPATCH_PRE[SDWDATE_POOL_THREE] done.
2459: getUrlDateDiff: https://schneier.com | Mon Mar 9 19:13:17 UTC 2015
2459: dispatching SDWDATE_CURL_DISPATCH_POST[SDWDATE_POOL_THREE]: /usr/lib/timesync/timesync_progress --identifier “timesync” --progressbaridx “$ID” --mode “$SDW_MODE” --whoami “$who_ami” --progressx 80
2459: dispatching SDWDATE_CURL_DISPATCH_POST[SDWDATE_POOL_THREE] done.
2459: WEB_DATE_FROM_TOOL_STRING_LENGTH: 31
2459: https://schneier.com (took 15s) => diff = 0 second(s)
2459: Results summary: one: 0 | two: 0 | three: 0 | second(s)
2459: Min: 0 | Max: 0 | Median diff: 0 second(s) [0 nanosecond(s)]
2459: local unixtime : 1425928412 | local time : Mon Mar 9 19:13:32 UTC 2015
2459: remote unixtime: 1425928412 | remote time: Mon Mar 9 19:13:32 UTC 2015
2459: sdwdate_terminate_sclockadj: subshell for sclockadj with pid 23268 no longer running. Exit code: 1
2459: sdwdate_terminate_sclockadj: subshell for sclockadj with pid 23268 exited with unexpected non-zero exit code: 1
2459: error_message: ############################################

Error detected! Please report this bug!

BASH_SOURCE: /usr/lib/sdwdate/modules.d/sdwdate

SDW_EXIT_ON_ERROR: 1

SDW_MODE: daemon

SDWDATE_SUBSHELL_SCLOCKADJ_EXIT_CODE: 1

exit_code: 127

error_cause: sdwdate_error_handler signal ERR detected with BASH_COMMAND:

sdwdate_error “$FUNCNAME: subshell for sclockadj exited with unexpected non-zero exit code: $SDWDATE_SUBSHELL_SCLOCKADJ_EXIT_CODE”
################### ||| Shortened log msg string length!
2459: dispatching post_error (SDW_MODE: daemon) (SDW_EXIT_ON_ERROR: 1): /usr/lib/timesync/timesync_post_error --identifier “timesync” --progressbaridx “$ID” --mode “$SDW_MODE” --whoami “$who_ami” “$error_message” & disown
2459: dispatching post_error done.
2459: sdwdate (not timesync!): Error detected. Cleaning up…
2459: sdwdate (not timesync!): signal ERR received. Cleaning up…
2459: sdwdate (not timesync!): signal ERR received. Exiting.
2459: sdwdate (not timesync!): Error detected. Exiting.
2488: Running sdwdate… pid: 2488 | LD_PRELOAD:
2488: sdwdate_preparation: Setting CURL to curl.anondist-orig.
2488: sdwdate_preparation: who_ami is set to user.
2488: dispatching pre (SDW_MODE: startup): /usr/lib/timesync/timesync_pre --autostart --identifier “timesync” --progressbaridx “$ID” --mode “$SDW_MODE” --whoami "$who_ami"
2488: dispatching prerequisite (SDW_MODE: startup) (CURL: curl.anondist-orig) (LD_PRELOAD: ): /usr/lib/anon-shared-helper-scripts/te_pe_tb_check
2488: DISPATCH_PREREQUISITE exited 2 | Tor is not yet fully bootstrapped. 90 % done. Tor reports: NOTICE BOOTSTRAP PROGRESS=90 TAG=circuit_create SUMMARY=“Establishing a Tor circuit” | waiting…
2488: DISPATCH_PREREQUISITE exited 0, continuing…
2488: allowed_member_failures: 5 (debugging information: temp: 5.10 | SDWDATE_POOL_ONE array_length: 15 | array_length_remember: 0)
2488: dispatching SDWDATE_CURL_DISPATCH_PRE[SDWDATE_POOL_ONE] (SDW_MODE: startup) (CURL: curl.anondist-orig): /usr/lib/timesync/timesync_progress --identifier “timesync” --progressbaridx “$ID” --mode “$SDW_MODE” --whoami “$who_ami” --progressx 15
2488: dispatching SDWDATE_CURL_DISPATCH_PRE[SDWDATE_POOL_ONE] done.
2488: getUrlDateDiff: https://debian.org | Mon Mar 9 19:47:39 UTC 2015
2488: dispatching SDWDATE_CURL_DISPATCH_POST[SDWDATE_POOL_ONE]: /usr/lib/timesync/timesync_progress --identifier “timesync” --progressbaridx “$ID” --mode “$SDW_MODE” --whoami “$who_ami” --progressx 30
2488: dispatching SDWDATE_CURL_DISPATCH_POST[SDWDATE_POOL_ONE] done.
2488: WEB_DATE_FROM_TOOL_STRING_LENGTH: 31
2488: https://debian.org (took 45s) => diff = 118 second(s)
2488: allowed_member_failures: 6 (debugging information: temp: 5.78 | SDWDATE_POOL_TWO array_length: 17 | array_length_remember: 0)
2488: dispatching SDWDATE_CURL_DISPATCH_PRE[SDWDATE_POOL_TWO] (SDW_MODE: startup) (CURL: curl.anondist-orig): /usr/lib/timesync/timesync_progress --identifier “timesync” --progressbaridx “$ID” --mode “$SDW_MODE” --whoami “$who_ami” --progressx 45
2488: dispatching SDWDATE_CURL_DISPATCH_PRE[SDWDATE_POOL_TWO] done.
2488: getUrlDateDiff: https://fsfe.org | Mon Mar 9 19:47:44 UTC 2015
2488: dispatching SDWDATE_CURL_DISPATCH_POST[SDWDATE_POOL_TWO]: /usr/lib/timesync/timesync_progress --identifier “timesync” --progressbaridx “$ID” --mode “$SDW_MODE” --whoami “$who_ami” --progressx 60
2488: dispatching SDWDATE_CURL_DISPATCH_POST[SDWDATE_POOL_TWO] done.
2488: WEB_DATE_FROM_TOOL_STRING_LENGTH: 31
2488: https://fsfe.org (took 3s) => diff = 119 second(s)
2488: allowed_member_failures: 6 (debugging information: temp: 5.78 | SDWDATE_POOL_THREE array_length: 17 | array_length_remember: 0)
2488: dispatching SDWDATE_CURL_DISPATCH_PRE[SDWDATE_POOL_THREE] (SDW_MODE: startup) (CURL: curl.anondist-orig): /usr/lib/timesync/timesync_progress --identifier “timesync” --progressbaridx “$ID” --mode “$SDW_MODE” --whoami “$who_ami” --progressx 65
2488: dispatching SDWDATE_CURL_DISPATCH_PRE[SDWDATE_POOL_THREE] done.
2488: getUrlDateDiff: https://www.ccc.de | Mon Mar 9 19:47:47 UTC 2015
2488: dispatching SDWDATE_CURL_DISPATCH_POST[SDWDATE_POOL_THREE]: /usr/lib/timesync/timesync_progress --identifier “timesync” --progressbaridx “$ID” --mode “$SDW_MODE” --whoami “$who_ami” --progressx 80
2488: dispatching SDWDATE_CURL_DISPATCH_POST[SDWDATE_POOL_THREE] done.
2488: WEB_DATE_FROM_TOOL_STRING_LENGTH: 31
2488: https://www.ccc.de (took 6s) => diff = 119 second(s)
2488: Results summary: one: 118 | two: 119 | three: 119 | second(s)
2488: Min: 118 | Max: 119 | Median diff: 119 second(s) [119000000000 nanosecond(s)]
2488: local unixtime : 1425930473 | local time : Mon Mar 9 19:47:53 UTC 2015
2488: remote unixtime: 1425930592 | remote time: Mon Mar 9 19:49:52 UTC 2015
2488: Made up random extra -0.690008242 second[s] [-690008242 nanosecond(s)].
2488: Time before setting: 1425930473.322386695 [Mon Mar 9 19:47:53 UTC 2015]
2488: Setting time using date to 1425930591.309991758…
2488: Time after setting using date: 1425930591.310817268 [Mon Mar 9 19:49:51 UTC 2015]
2488: dispatching post_success (SDW_MODE: startup): /usr/lib/timesync/timesync_post_success --autostart --identifier “timesync” --progressbaridx “$ID” --mode “$SDW_MODE” --whoami "$who_ami"
2488: dispatching post_success done.
2488: Sleeping for 48 minutes. (RANDOMIZE: 1)
[/CODE]

[quote=“Patrick, post:2, topic:904”]A 3.

Will check later if it’s fixed in latest development version.[/quote]
Was fixed.

aha very good excellent job friend :slight_smile: , and how about A 2 ? did u get all the infos u wanted ? and is it normal or working on it or should i ignore it ? thnx <<< fixed from A3 TO A2 hehe sorry

^^^ just noticed now damn lol :-X

Apparmor 1 and 2 will be fixed once upgrades are released.

Apparmor 3 is a unknown issue for now. There is a separate apparmor sub forum below the support forum. Please post it there.

well thats great to hear , i have mad the other new topic because i didnt c any reply so i thought u might didnt/missed read what did i have typed after ur last reply because u know i thought u have received no notification or something like that so i separated them in a new topic. sorry if thats went against the rules and i re-typed it to be a separated topic with a new useful info thnx again for ur news (f)

how to move this topic from this forum to whonix apparmor forum?

Not the whole topic. Just the specific apparmor issue that has not been addressed yet. Just make a new post.

[Imprint] [Privacy Policy] [Cookie Policy] [Terms of Use] [E-Sign Consent] [DMCA] [Investors] [Priority Support] [Professional Support]