builder: date-linux64
slave: bld-linux64-spot-302
starttime: 1479575397.43
results: exception (4)
buildid: 20161119090421
builduid: d61b5fe9a2484490842622a9b5673fb4
revision: cddf812062e3acb702e0a10160bf760c8f7cfe50

========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-11-19 09:09:57.433871) =========
master: http://buildbot-master74.bb.releng.usw2.mozilla.com:8001/
========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-11-19 09:09:57.434302) =========

========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-11-19 09:09:57.434606) =========
========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-11-19 09:09:57.503027) =========

========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-11-19 09:09:57.503323) =========
rm -rf scripts properties
 in dir /builds/slave/date-l64-000000000000000000000/. (timeout 1200 secs)
 watching logfiles {}
 argv: ['rm', '-rf', 'scripts', 'properties']
 environment:
  CCACHE_HASHDIR=
  G_BROKEN_FILENAMES=1
  HISTCONTROL=ignoredups
  HISTSIZE=1000
  HOME=/home/cltbld
  HOSTNAME=bld-linux64-spot-302.build.releng.usw2.mozilla.com
  LANG=en_US.UTF-8
  LESSOPEN=|/usr/bin/lesspipe.sh %s
  LOGNAME=cltbld
  MAIL=/var/spool/mail/cltbld
  PATH=/usr/local/bin:/usr/lib64/ccache:/usr/local/bin:/bin:/usr/bin:/usr/local/sbin:/usr/sbin:/sbin:/home/cltbld/bin
  PWD=/builds/slave/date-l64-000000000000000000000
  SHELL=/bin/bash
  SHLVL=1
  TERM=linux
  TMOUT=86400
  USER=cltbld
  _=/tools/buildbot/bin/python
 using PTY: False
program finished with exit code 0
elapsedTime=0.003487
========= master_lag: 0.05 =========
========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-11-19 09:09:57.552838) =========

========= Started 'bash -c ...' exception (results: 4, elapsed: 8 mins, 30 secs) (at 2016-11-19 09:09:57.553231) =========
bash -c 'python /tools/checkouts/build-tools/buildfarm/utils/archiver_client.py mozharness --repo projects/date --rev cddf812062e3acb702e0a10160bf760c8f7cfe50 --destination scripts --debug'
 in dir /builds/slave/date-l64-000000000000000000000/. (timeout 1200 secs)
 watching logfiles {}
 argv: ['bash', '-c', u'python /tools/checkouts/build-tools/buildfarm/utils/archiver_client.py mozharness --repo projects/date --rev cddf812062e3acb702e0a10160bf760c8f7cfe50 --destination scripts --debug']
 environment:
  CCACHE_HASHDIR=
  G_BROKEN_FILENAMES=1
  HISTCONTROL=ignoredups
  HISTSIZE=1000
  HOME=/home/cltbld
  HOSTNAME=bld-linux64-spot-302.build.releng.usw2.mozilla.com
  LANG=en_US.UTF-8
  LESSOPEN=|/usr/bin/lesspipe.sh %s
  LOGNAME=cltbld
  MAIL=/var/spool/mail/cltbld
  PATH=/usr/local/bin:/usr/lib64/ccache:/usr/local/bin:/bin:/usr/bin:/usr/local/sbin:/usr/sbin:/sbin:/home/cltbld/bin
  PWD=/builds/slave/date-l64-000000000000000000000
  SHELL=/bin/bash
  SHLVL=1
  TERM=linux
  TMOUT=86400
  USER=cltbld
  _=/tools/buildbot/bin/python
 using PTY: False
2016-11-19 09:09:57,599 truncating revision to first 12 chars
2016-11-19 09:09:57,599 Setting DEBUG logging.
2016-11-19 09:09:57,600 attempt 1/10
2016-11-19 09:09:57,600 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/projects/date/cddf812062e3?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness
2016-11-19 09:09:57,989 attempt 1/10
2016-11-19 09:09:58,433 current task status: no status available at this point. state: PENDING
2016-11-19 09:09:58,433 sleeping for 11.00s (attempt 1/10)
2016-11-19 09:10:09,445 attempt 2/10
2016-11-19 09:10:09,835 current task status: no status available at this point. state: PENDING
2016-11-19 09:10:09,836 sleeping for 15.50s (attempt 2/10)
2016-11-19 09:10:25,351 attempt 3/10
2016-11-19 09:10:25,844 current task status: no status available at this point. state: PENDING
2016-11-19 09:10:25,844 sleeping for 22.25s (attempt 3/10)
2016-11-19 09:10:48,117 attempt 4/10
2016-11-19 09:10:48,533 current task status: no status available at this point. state: PENDING
2016-11-19 09:10:48,533 sleeping for 33.38s (attempt 4/10)
2016-11-19 09:11:21,942 attempt 5/10
2016-11-19 09:11:22,335 current task status: no status available at this point. state: PENDING
2016-11-19 09:11:22,335 sleeping for 49.06s (attempt 5/10)
2016-11-19 09:12:11,447 attempt 6/10
2016-11-19 09:12:11,865 current task status: Task has expired from pending for too long. Re-creating task. state: RETRY
2016-11-19 09:12:11,865 sleeping for 74.59s (attempt 6/10)
2016-11-19 09:13:26,534 attempt 7/10
2016-11-19 09:13:26,944 current task status: Task has expired from pending for too long. Re-creating task. state: RETRY
2016-11-19 09:13:26,944 sleeping for 100.00s (attempt 7/10)
2016-11-19 09:15:07,044 attempt 8/10
2016-11-19 09:15:07,456 current task status: Task has expired from pending for too long. Re-creating task. state: RETRY
2016-11-19 09:15:07,456 sleeping for 101.00s (attempt 8/10)
2016-11-19 09:16:48,557 attempt 9/10
2016-11-19 09:16:49,002 current task status: Task has expired from pending for too long. Re-creating task. state: RETRY
2016-11-19 09:16:49,002 sleeping for 99.00s (attempt 9/10)
2016-11-19 09:18:28,102 attempt 10/10
2016-11-19 09:18:28,464 current task status: Task has expired from pending for too long. Re-creating task. state: RETRY
2016-11-19 09:18:28,464 Automation Error: task state did not equal SUCCESS
2016-11-19 09:18:28,464 Check archiver logs for errors. Task status: Task has expired from pending for too long. Re-creating task. Task state: RETRY
program finished with exit code 3
elapsedTime=510.912784
========= master_lag: 0.02 =========
========= Finished 'bash -c ...' exception (results: 4, elapsed: 8 mins, 30 secs) (at 2016-11-19 09:18:28.481271) =========

========= Skipped  (results: not started, elapsed: not started) =========
========= Skipped  (results: not started, elapsed: not started) =========
========= Skipped  (results: not started, elapsed: not started) =========
========= Skipped  (results: not started, elapsed: not started) =========
========= Skipped  (results: not started, elapsed: not started) =========
========= Skipped  (results: not started, elapsed: not started) =========
========= Started no change (results: 0, elapsed: 0 secs) (at 2016-11-19 09:18:28.481657) =========
bash -c 'for file in `ls -1`; do cat $file; done'
 in dir /builds/slave/date-l64-000000000000000000000/properties (timeout 1200 secs)
 watching logfiles {}
 argv: ['bash', '-c', 'for file in `ls -1`; do cat $file; done']
 environment:
  CCACHE_HASHDIR=
  G_BROKEN_FILENAMES=1
  HISTCONTROL=ignoredups
  HISTSIZE=1000
  HOME=/home/cltbld
  HOSTNAME=bld-linux64-spot-302.build.releng.usw2.mozilla.com
  LANG=en_US.UTF-8
  LESSOPEN=|/usr/bin/lesspipe.sh %s
  LOGNAME=cltbld
  MAIL=/var/spool/mail/cltbld
  PATH=/usr/local/bin:/usr/lib64/ccache:/usr/local/bin:/bin:/usr/bin:/usr/local/sbin:/usr/sbin:/sbin:/home/cltbld/bin
  PWD=/builds/slave/date-l64-000000000000000000000/properties
  SHELL=/bin/bash
  SHLVL=1
  TERM=linux
  TMOUT=86400
  USER=cltbld
  _=/tools/buildbot/bin/python
 using PTY: False
program finished with exit code 0
elapsedTime=0.004758

========= master_lag: 0.05 =========
========= Finished no change (results: 0, elapsed: 0 secs) (at 2016-11-19 09:18:28.541205) =========

========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-11-19 09:18:28.541523) =========
rm -f oauth.txt
 in dir /builds/slave/date-l64-000000000000000000000/. (timeout 1200 secs)
 watching logfiles {}
 argv: ['rm', '-f', 'oauth.txt']
 environment:
  CCACHE_HASHDIR=
  G_BROKEN_FILENAMES=1
  HISTCONTROL=ignoredups
  HISTSIZE=1000
  HOME=/home/cltbld
  HOSTNAME=bld-linux64-spot-302.build.releng.usw2.mozilla.com
  LANG=en_US.UTF-8
  LESSOPEN=|/usr/bin/lesspipe.sh %s
  LOGNAME=cltbld
  MAIL=/var/spool/mail/cltbld
  PATH=/usr/local/bin:/usr/lib64/ccache:/usr/local/bin:/bin:/usr/bin:/usr/local/sbin:/usr/sbin:/sbin:/home/cltbld/bin
  PWD=/builds/slave/date-l64-000000000000000000000
  SHELL=/bin/bash
  SHLVL=1
  TERM=linux
  TMOUT=86400
  USER=cltbld
  _=/tools/buildbot/bin/python
 using PTY: False
program finished with exit code 0
elapsedTime=0.002442
========= master_lag: 0.04 =========
========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-11-19 09:18:28.587745) =========

========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-11-19 09:18:28.588026) =========
========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-11-19 09:18:28.588259) =========

========= Total master_lag: 0.16 =========