builder: fx-team_win8_64_test-dromaeojs slave: t-w864-ix-155 starttime: 1445555841.69 results: success (0) buildid: 20151022143900 builduid: a04a2170117e4679aa1c82167f293edb revision: ddb5b8e191c9e6cd1f8f1b6c7524eab20747a402 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2015-10-22 16:17:21.686327) ========= master: http://buildbot-master112.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2015-10-22 16:17:21.687791) ========= ========= Started set props: basedir (results: 0, elapsed: 0 secs) (at 2015-10-22 16:17:21.688287) ========= 'cd' in dir C:\slave\test\. (timeout 1200 secs) watching logfiles {} argv: ['cd'] environment: ALLUSERSPROFILE=C:\ProgramData APPDATA=C:\Users\cltbld.T-W864-IX-155\AppData\Roaming COMMONPROGRAMFILES=C:\Program Files (x86)\Common Files COMMONPROGRAMFILES(X86)=C:\Program Files (x86)\Common Files COMMONPROGRAMW6432=C:\Program Files\Common Files COMPUTERNAME=T-W864-IX-155 COMSPEC=C:\windows\system32\cmd.exe DCLOCATION=SCL3 DNSSUFFIX=wintest.releng.scl3.mozilla.com FP_NO_HOST_CHECK=NO HOMEDRIVE=C: HOMEPATH=\Users\cltbld.T-W864-IX-155 KTS_HOME=C:\Program Files\KTS KTS_VERSION=1.19c LOCALAPPDATA=C:\Users\cltbld.T-W864-IX-155\AppData\Local LOGONSERVER=\\T-W864-IX-155 MONDIR=C:\Monitor_config\ MOZBUILDDIR=C:\mozilla-build\ MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NO_EM_RESTART=1 NUMBER_OF_PROCESSORS=8 OS=Windows_NT OURDRIVE=C: PATH=C:\Program Files (x86)\NVIDIA Corporation\PhysX\Common;C:\windows\system32;C:\windows;C:\windows\System32\Wbem;C:\windows\System32\WindowsPowerShell\v1.0\;C:\mozilla-build\python27;C:\mozilla-build\python27\Scripts;C:\mozilla-build\msys\bin;C:\mozilla-build\vim\vim72;C:\mozilla-build\wget;C:\mozilla-build\info-zip;C:\CoreUtils\bin;C:\mozilla-build\buildbotve\scripts;C:\mozilla-build\hg PATHEXT=.COM;.EXE;.BAT;.CMD;.VBS;.VBE;.JS;.JSE;.WSF;.WSH;.MSC PROCESSOR_ARCHITECTURE=x86 PROCESSOR_ARCHITEW6432=AMD64 PROCESSOR_IDENTIFIER=Intel64 Family 6 Model 30 Stepping 5, GenuineIntel PROCESSOR_LEVEL=6 PROCESSOR_REVISION=1e05 PROGRAMDATA=C:\ProgramData PROGRAMFILES=C:\Program Files (x86) PROGRAMFILES(X86)=C:\Program Files (x86) PROGRAMW6432=C:\Program Files PROMPT=$P$G PSMODULEPATH=C:\windows\system32\WindowsPowerShell\v1.0\Modules\ PUBLIC=C:\Users\Public PWD=C:\slave\test RUNLOGFILE=C:\slave\\runslave.log SLAVEDIR=C:\slave\ SYSTEMDRIVE=C: SYSTEMROOT=C:\windows TEMP=C:\Users\CLTBLD~1.T-W\AppData\Local\Temp TEST1=testie TMP=C:\Users\CLTBLD~1.T-W\AppData\Local\Temp USERDOMAIN=T-W864-IX-155 USERDOMAIN_ROAMINGPROFILE=T-W864-IX-155 USERNAME=cltbld USERPROFILE=C:\Users\cltbld.T-W864-IX-155 WINDIR=C:\windows XPCOM_DEBUG_BREAK=warn using PTY: False C:\slave\test program finished with exit code 0 elapsedTime=0.734000 basedir: 'C:\\slave\\test' ========= Finished set props: basedir (results: 0, elapsed: 0 secs) (at 2015-10-22 16:17:22.439953) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2015-10-22 16:17:22.440285) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2015-10-22 16:17:22.566145) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-10-22 16:17:22.566592) ========= 'rm' '-rf' 'properties' in dir C:\slave\test\. (timeout 1200 secs) watching logfiles {} argv: ['rm', '-rf', 'properties'] environment: ALLUSERSPROFILE=C:\ProgramData APPDATA=C:\Users\cltbld.T-W864-IX-155\AppData\Roaming COMMONPROGRAMFILES=C:\Program Files (x86)\Common Files COMMONPROGRAMFILES(X86)=C:\Program Files (x86)\Common Files COMMONPROGRAMW6432=C:\Program Files\Common Files COMPUTERNAME=T-W864-IX-155 COMSPEC=C:\windows\system32\cmd.exe DCLOCATION=SCL3 DNSSUFFIX=wintest.releng.scl3.mozilla.com FP_NO_HOST_CHECK=NO HOMEDRIVE=C: HOMEPATH=\Users\cltbld.T-W864-IX-155 KTS_HOME=C:\Program Files\KTS KTS_VERSION=1.19c LOCALAPPDATA=C:\Users\cltbld.T-W864-IX-155\AppData\Local LOGONSERVER=\\T-W864-IX-155 MONDIR=C:\Monitor_config\ MOZBUILDDIR=C:\mozilla-build\ MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NO_EM_RESTART=1 NUMBER_OF_PROCESSORS=8 OS=Windows_NT OURDRIVE=C: PATH=C:\Program Files (x86)\NVIDIA Corporation\PhysX\Common;C:\windows\system32;C:\windows;C:\windows\System32\Wbem;C:\windows\System32\WindowsPowerShell\v1.0\;C:\mozilla-build\python27;C:\mozilla-build\python27\Scripts;C:\mozilla-build\msys\bin;C:\mozilla-build\vim\vim72;C:\mozilla-build\wget;C:\mozilla-build\info-zip;C:\CoreUtils\bin;C:\mozilla-build\buildbotve\scripts;C:\mozilla-build\hg PATHEXT=.COM;.EXE;.BAT;.CMD;.VBS;.VBE;.JS;.JSE;.WSF;.WSH;.MSC PROCESSOR_ARCHITECTURE=x86 PROCESSOR_ARCHITEW6432=AMD64 PROCESSOR_IDENTIFIER=Intel64 Family 6 Model 30 Stepping 5, GenuineIntel PROCESSOR_LEVEL=6 PROCESSOR_REVISION=1e05 PROGRAMDATA=C:\ProgramData PROGRAMFILES=C:\Program Files (x86) PROGRAMFILES(X86)=C:\Program Files (x86) PROGRAMW6432=C:\Program Files PROMPT=$P$G PSMODULEPATH=C:\windows\system32\WindowsPowerShell\v1.0\Modules\ PUBLIC=C:\Users\Public PWD=C:\slave\test RUNLOGFILE=C:\slave\\runslave.log SLAVEDIR=C:\slave\ SYSTEMDRIVE=C: SYSTEMROOT=C:\windows TEMP=C:\Users\CLTBLD~1.T-W\AppData\Local\Temp TEST1=testie TMP=C:\Users\CLTBLD~1.T-W\AppData\Local\Temp USERDOMAIN=T-W864-IX-155 USERDOMAIN_ROAMINGPROFILE=T-W864-IX-155 USERNAME=cltbld USERPROFILE=C:\Users\cltbld.T-W864-IX-155 WINDIR=C:\windows XPCOM_DEBUG_BREAK=warn using PTY: False program finished with exit code 0 elapsedTime=0.201000 ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-10-22 16:17:23.248099) ========= ========= Started set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2015-10-22 16:17:23.248488) ========= script_repo_url: https://hg.mozilla.org/build/mozharness ========= Finished set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2015-10-22 16:17:23.249151) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2015-10-22 16:17:23.249460) ========= 'bash' '-c' 'wget -Oarchiver_client.py --no-check-certificate --tries=10 --waitretry=3 https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py' in dir C:\slave\test\. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', 'wget -Oarchiver_client.py --no-check-certificate --tries=10 --waitretry=3 https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py'] environment: ALLUSERSPROFILE=C:\ProgramData APPDATA=C:\Users\cltbld.T-W864-IX-155\AppData\Roaming COMMONPROGRAMFILES=C:\Program Files (x86)\Common Files COMMONPROGRAMFILES(X86)=C:\Program Files (x86)\Common Files COMMONPROGRAMW6432=C:\Program Files\Common Files COMPUTERNAME=T-W864-IX-155 COMSPEC=C:\windows\system32\cmd.exe DCLOCATION=SCL3 DNSSUFFIX=wintest.releng.scl3.mozilla.com FP_NO_HOST_CHECK=NO HOMEDRIVE=C: HOMEPATH=\Users\cltbld.T-W864-IX-155 KTS_HOME=C:\Program Files\KTS KTS_VERSION=1.19c LOCALAPPDATA=C:\Users\cltbld.T-W864-IX-155\AppData\Local LOGONSERVER=\\T-W864-IX-155 MONDIR=C:\Monitor_config\ MOZBUILDDIR=C:\mozilla-build\ MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NO_EM_RESTART=1 NUMBER_OF_PROCESSORS=8 OS=Windows_NT OURDRIVE=C: PATH=C:\Program Files (x86)\NVIDIA Corporation\PhysX\Common;C:\windows\system32;C:\windows;C:\windows\System32\Wbem;C:\windows\System32\WindowsPowerShell\v1.0\;C:\mozilla-build\python27;C:\mozilla-build\python27\Scripts;C:\mozilla-build\msys\bin;C:\mozilla-build\vim\vim72;C:\mozilla-build\wget;C:\mozilla-build\info-zip;C:\CoreUtils\bin;C:\mozilla-build\buildbotve\scripts;C:\mozilla-build\hg PATHEXT=.COM;.EXE;.BAT;.CMD;.VBS;.VBE;.JS;.JSE;.WSF;.WSH;.MSC PROCESSOR_ARCHITECTURE=x86 PROCESSOR_ARCHITEW6432=AMD64 PROCESSOR_IDENTIFIER=Intel64 Family 6 Model 30 Stepping 5, GenuineIntel PROCESSOR_LEVEL=6 PROCESSOR_REVISION=1e05 PROGRAMDATA=C:\ProgramData PROGRAMFILES=C:\Program Files (x86) PROGRAMFILES(X86)=C:\Program Files (x86) PROGRAMW6432=C:\Program Files PROMPT=$P$G PSMODULEPATH=C:\windows\system32\WindowsPowerShell\v1.0\Modules\ PUBLIC=C:\Users\Public PWD=C:\slave\test RUNLOGFILE=C:\slave\\runslave.log SLAVEDIR=C:\slave\ SYSTEMDRIVE=C: SYSTEMROOT=C:\windows TEMP=C:\Users\CLTBLD~1.T-W\AppData\Local\Temp TEST1=testie TMP=C:\Users\CLTBLD~1.T-W\AppData\Local\Temp USERDOMAIN=T-W864-IX-155 USERDOMAIN_ROAMINGPROFILE=T-W864-IX-155 USERNAME=cltbld USERPROFILE=C:\Users\cltbld.T-W864-IX-155 WINDIR=C:\windows XPCOM_DEBUG_BREAK=warn using PTY: False --16:17:23-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py => `archiver_client.py' Resolving hg.mozilla.org... 63.245.215.25, 63.245.215.102 Connecting to hg.mozilla.org|63.245.215.25|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12,141 (12K) [text/x-python] 0K .......... . 100% 9.98 MB/s 16:17:24 (9.98 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=1.049000 ========= Finished 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2015-10-22 16:17:24.455599) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 2 secs) (at 2015-10-22 16:17:24.456016) ========= 'rm' '-rf' 'scripts' in dir C:\slave\test\. (timeout 1200 secs) watching logfiles {} argv: ['rm', '-rf', 'scripts'] environment: ALLUSERSPROFILE=C:\ProgramData APPDATA=C:\Users\cltbld.T-W864-IX-155\AppData\Roaming COMMONPROGRAMFILES=C:\Program Files (x86)\Common Files COMMONPROGRAMFILES(X86)=C:\Program Files (x86)\Common Files COMMONPROGRAMW6432=C:\Program Files\Common Files COMPUTERNAME=T-W864-IX-155 COMSPEC=C:\windows\system32\cmd.exe DCLOCATION=SCL3 DNSSUFFIX=wintest.releng.scl3.mozilla.com FP_NO_HOST_CHECK=NO HOMEDRIVE=C: HOMEPATH=\Users\cltbld.T-W864-IX-155 KTS_HOME=C:\Program Files\KTS KTS_VERSION=1.19c LOCALAPPDATA=C:\Users\cltbld.T-W864-IX-155\AppData\Local LOGONSERVER=\\T-W864-IX-155 MONDIR=C:\Monitor_config\ MOZBUILDDIR=C:\mozilla-build\ MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NO_EM_RESTART=1 NUMBER_OF_PROCESSORS=8 OS=Windows_NT OURDRIVE=C: PATH=C:\Program Files (x86)\NVIDIA Corporation\PhysX\Common;C:\windows\system32;C:\windows;C:\windows\System32\Wbem;C:\windows\System32\WindowsPowerShell\v1.0\;C:\mozilla-build\python27;C:\mozilla-build\python27\Scripts;C:\mozilla-build\msys\bin;C:\mozilla-build\vim\vim72;C:\mozilla-build\wget;C:\mozilla-build\info-zip;C:\CoreUtils\bin;C:\mozilla-build\buildbotve\scripts;C:\mozilla-build\hg PATHEXT=.COM;.EXE;.BAT;.CMD;.VBS;.VBE;.JS;.JSE;.WSF;.WSH;.MSC PROCESSOR_ARCHITECTURE=x86 PROCESSOR_ARCHITEW6432=AMD64 PROCESSOR_IDENTIFIER=Intel64 Family 6 Model 30 Stepping 5, GenuineIntel PROCESSOR_LEVEL=6 PROCESSOR_REVISION=1e05 PROGRAMDATA=C:\ProgramData PROGRAMFILES=C:\Program Files (x86) PROGRAMFILES(X86)=C:\Program Files (x86) PROGRAMW6432=C:\Program Files PROMPT=$P$G PSMODULEPATH=C:\windows\system32\WindowsPowerShell\v1.0\Modules\ PUBLIC=C:\Users\Public PWD=C:\slave\test RUNLOGFILE=C:\slave\\runslave.log SLAVEDIR=C:\slave\ SYSTEMDRIVE=C: SYSTEMROOT=C:\windows TEMP=C:\Users\CLTBLD~1.T-W\AppData\Local\Temp TEST1=testie TMP=C:\Users\CLTBLD~1.T-W\AppData\Local\Temp USERDOMAIN=T-W864-IX-155 USERDOMAIN_ROAMINGPROFILE=T-W864-IX-155 USERNAME=cltbld USERPROFILE=C:\Users\cltbld.T-W864-IX-155 WINDIR=C:\windows XPCOM_DEBUG_BREAK=warn using PTY: False program finished with exit code 0 elapsedTime=2.907000 ========= Finished 'rm -rf ...' (results: 0, elapsed: 2 secs) (at 2015-10-22 16:17:27.375169) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2015-10-22 16:17:27.375534) ========= 'bash' '-c' u'python archiver_client.py mozharness --repo integration/fx-team --rev ddb5b8e191c9e6cd1f8f1b6c7524eab20747a402 --destination scripts --debug' in dir C:\slave\test\. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', u'python archiver_client.py mozharness --repo integration/fx-team --rev ddb5b8e191c9e6cd1f8f1b6c7524eab20747a402 --destination scripts --debug'] environment: ALLUSERSPROFILE=C:\ProgramData APPDATA=C:\Users\cltbld.T-W864-IX-155\AppData\Roaming COMMONPROGRAMFILES=C:\Program Files (x86)\Common Files COMMONPROGRAMFILES(X86)=C:\Program Files (x86)\Common Files COMMONPROGRAMW6432=C:\Program Files\Common Files COMPUTERNAME=T-W864-IX-155 COMSPEC=C:\windows\system32\cmd.exe DCLOCATION=SCL3 DNSSUFFIX=wintest.releng.scl3.mozilla.com FP_NO_HOST_CHECK=NO HOMEDRIVE=C: HOMEPATH=\Users\cltbld.T-W864-IX-155 KTS_HOME=C:\Program Files\KTS KTS_VERSION=1.19c LOCALAPPDATA=C:\Users\cltbld.T-W864-IX-155\AppData\Local LOGONSERVER=\\T-W864-IX-155 MONDIR=C:\Monitor_config\ MOZBUILDDIR=C:\mozilla-build\ MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NO_EM_RESTART=1 NUMBER_OF_PROCESSORS=8 OS=Windows_NT OURDRIVE=C: PATH=C:\Program Files (x86)\NVIDIA Corporation\PhysX\Common;C:\windows\system32;C:\windows;C:\windows\System32\Wbem;C:\windows\System32\WindowsPowerShell\v1.0\;C:\mozilla-build\python27;C:\mozilla-build\python27\Scripts;C:\mozilla-build\msys\bin;C:\mozilla-build\vim\vim72;C:\mozilla-build\wget;C:\mozilla-build\info-zip;C:\CoreUtils\bin;C:\mozilla-build\buildbotve\scripts;C:\mozilla-build\hg PATHEXT=.COM;.EXE;.BAT;.CMD;.VBS;.VBE;.JS;.JSE;.WSF;.WSH;.MSC PROCESSOR_ARCHITECTURE=x86 PROCESSOR_ARCHITEW6432=AMD64 PROCESSOR_IDENTIFIER=Intel64 Family 6 Model 30 Stepping 5, GenuineIntel PROCESSOR_LEVEL=6 PROCESSOR_REVISION=1e05 PROGRAMDATA=C:\ProgramData PROGRAMFILES=C:\Program Files (x86) PROGRAMFILES(X86)=C:\Program Files (x86) PROGRAMW6432=C:\Program Files PROMPT=$P$G PSMODULEPATH=C:\windows\system32\WindowsPowerShell\v1.0\Modules\ PUBLIC=C:\Users\Public PWD=C:\slave\test RUNLOGFILE=C:\slave\\runslave.log SLAVEDIR=C:\slave\ SYSTEMDRIVE=C: SYSTEMROOT=C:\windows TEMP=C:\Users\CLTBLD~1.T-W\AppData\Local\Temp TEST1=testie TMP=C:\Users\CLTBLD~1.T-W\AppData\Local\Temp USERDOMAIN=T-W864-IX-155 USERDOMAIN_ROAMINGPROFILE=T-W864-IX-155 USERNAME=cltbld USERPROFILE=C:\Users\cltbld.T-W864-IX-155 WINDIR=C:\windows XPCOM_DEBUG_BREAK=warn using PTY: False 2015-10-22 16:17:27,368 truncating revision to first 12 chars 2015-10-22 16:17:27,368 Setting DEBUG logging. 2015-10-22 16:17:27,368 attempt 1/10 2015-10-22 16:17:27,368 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/integration/fx-team/ddb5b8e191c9?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2015-10-22 16:17:28,270 unpacking tar archive at: fx-team-ddb5b8e191c9/testing/mozharness/ program finished with exit code 0 elapsedTime=1.494000 ========= Finished 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2015-10-22 16:17:28.924708) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2015-10-22 16:17:28.925106) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2015-10-22 16:17:28.941141) ========= ========= Started tinderboxprint_script_revlink (results: 0, elapsed: 0 secs) (at 2015-10-22 16:17:28.941555) ========= TinderboxPrint: script_revlink: https://hg.mozilla.org/build/mozharness/rev/production ========= Finished tinderboxprint_script_revlink (results: 0, elapsed: 0 secs) (at 2015-10-22 16:17:28.942008) ========= ========= Started 'c:/mozilla-build/python27/python -u ...' (results: 0, elapsed: 25 mins, 9 secs) (at 2015-10-22 16:17:28.942316) ========= 'c:/mozilla-build/python27/python' '-u' 'scripts/scripts/talos_script.py' '--suite' 'dromaeojs' '--add-option' '--webServer,localhost' '--branch-name' 'Fx-Team-Non-PGO' '--system-bits' '64' '--cfg' 'talos/windows_config.py' '--download-symbols' 'ondemand' '--use-talos-json' '--blob-upload-branch' 'Fx-Team-Non-PGO' in dir C:\slave\test\. (timeout 3600 secs) (maxTime 7200 secs) watching logfiles {} argv: ['c:/mozilla-build/python27/python', '-u', 'scripts/scripts/talos_script.py', '--suite', 'dromaeojs', '--add-option', '--webServer,localhost', '--branch-name', 'Fx-Team-Non-PGO', '--system-bits', '64', '--cfg', 'talos/windows_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Fx-Team-Non-PGO'] environment: ALLUSERSPROFILE=C:\ProgramData APPDATA=C:\Users\cltbld.T-W864-IX-155\AppData\Roaming COMMONPROGRAMFILES=C:\Program Files (x86)\Common Files COMMONPROGRAMFILES(X86)=C:\Program Files (x86)\Common Files COMMONPROGRAMW6432=C:\Program Files\Common Files COMPUTERNAME=T-W864-IX-155 COMSPEC=C:\windows\system32\cmd.exe DCLOCATION=SCL3 DNSSUFFIX=wintest.releng.scl3.mozilla.com FP_NO_HOST_CHECK=NO HOMEDRIVE=C: HOMEPATH=\Users\cltbld.T-W864-IX-155 KTS_HOME=C:\Program Files\KTS KTS_VERSION=1.19c LOCALAPPDATA=C:\Users\cltbld.T-W864-IX-155\AppData\Local LOGONSERVER=\\T-W864-IX-155 MONDIR=C:\Monitor_config\ MOZBUILDDIR=C:\mozilla-build\ MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NO_EM_RESTART=1 NUMBER_OF_PROCESSORS=8 OS=Windows_NT OURDRIVE=C: PATH=C:\Program Files (x86)\NVIDIA Corporation\PhysX\Common;C:\windows\system32;C:\windows;C:\windows\System32\Wbem;C:\windows\System32\WindowsPowerShell\v1.0\;C:\mozilla-build\python27;C:\mozilla-build\python27\Scripts;C:\mozilla-build\msys\bin;C:\mozilla-build\vim\vim72;C:\mozilla-build\wget;C:\mozilla-build\info-zip;C:\CoreUtils\bin;C:\mozilla-build\buildbotve\scripts;C:\mozilla-build\hg PATHEXT=.COM;.EXE;.BAT;.CMD;.VBS;.VBE;.JS;.JSE;.WSF;.WSH;.MSC PROCESSOR_ARCHITECTURE=x86 PROCESSOR_ARCHITEW6432=AMD64 PROCESSOR_IDENTIFIER=Intel64 Family 6 Model 30 Stepping 5, GenuineIntel PROCESSOR_LEVEL=6 PROCESSOR_REVISION=1e05 PROGRAMDATA=C:\ProgramData PROGRAMFILES=C:\Program Files (x86) PROGRAMFILES(X86)=C:\Program Files (x86) PROGRAMW6432=C:\Program Files PROMPT=$P$G PROPERTIES_FILE=C:\slave\test/buildprops.json PSMODULEPATH=C:\windows\system32\WindowsPowerShell\v1.0\Modules\ PUBLIC=C:\Users\Public PWD=C:\slave\test RUNLOGFILE=C:\slave\\runslave.log SLAVEDIR=C:\slave\ SYSTEMDRIVE=C: SYSTEMROOT=C:\windows TEMP=C:\Users\CLTBLD~1.T-W\AppData\Local\Temp TEST1=testie TMP=C:\Users\CLTBLD~1.T-W\AppData\Local\Temp USERDOMAIN=T-W864-IX-155 USERDOMAIN_ROAMINGPROFILE=T-W864-IX-155 USERNAME=cltbld USERPROFILE=C:\Users\cltbld.T-W864-IX-155 WINDIR=C:\windows XPCOM_DEBUG_BREAK=warn using PTY: False 16:17:28 INFO - MultiFileLogger online at 20151022 16:17:28 in C:\slave\test 16:17:28 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Fx-Team-Non-PGO --system-bits 64 --cfg talos/windows_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Fx-Team-Non-PGO 16:17:28 INFO - Dumping config to C:\slave\test\logs\localconfig.json. 16:17:29 INFO - {'append_to_log': False, 16:17:29 INFO - 'base_work_dir': 'C:\\slave\\test', 16:17:29 INFO - 'blob_upload_branch': 'Fx-Team-Non-PGO', 16:17:29 INFO - 'blob_uploader_auth_file': 'C:\\slave\\test\\oauth.txt', 16:17:29 INFO - 'branch': 'Fx-Team-Non-PGO', 16:17:29 INFO - 'buildbot_json_path': 'buildprops.json', 16:17:29 INFO - 'config_files': ('talos/windows_config.py',), 16:17:29 INFO - 'default_actions': ('clobber', 16:17:29 INFO - 'read-buildbot-config', 16:17:29 INFO - 'download-and-extract', 16:17:29 INFO - 'populate-webroot', 16:17:29 INFO - 'create-virtualenv', 16:17:29 INFO - 'install', 16:17:29 INFO - 'run-tests'), 16:17:29 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 16:17:29 INFO - 'download_minidump_stackwalk': True, 16:17:29 INFO - 'download_symbols': 'ondemand', 16:17:29 INFO - 'exes': {'easy_install': ('C:\\slave\\test\\build/venv/scripts/python', 16:17:29 INFO - 'C:\\slave\\test\\build/venv/scripts/easy_install-2.7-script.py'), 16:17:29 INFO - 'hg': 'c:/mozilla-build/hg/hg', 16:17:29 INFO - 'mozinstall': ('C:\\slave\\test\\build/venv/scripts/python', 16:17:29 INFO - 'C:\\slave\\test\\build/venv/scripts/mozinstall-script.py'), 16:17:29 INFO - 'python': 'c:/mozilla-build/python27/python.exe', 16:17:29 INFO - 'tooltool.py': ('c:/mozilla-build/python27/python.exe', 16:17:29 INFO - 'C:/mozilla-build/tooltool.py'), 16:17:29 INFO - 'virtualenv': ('c:/mozilla-build/python27/python.exe', 16:17:29 INFO - 'c:/mozilla-build/buildbotve/virtualenv.py')}, 16:17:29 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 16:17:29 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 16:17:29 INFO - 'installer_path': 'installer.exe', 16:17:29 INFO - 'log_level': 'info', 16:17:29 INFO - 'log_name': 'talos', 16:17:29 INFO - 'log_to_console': True, 16:17:29 INFO - 'metro_harness_path_frmt': '%(metro_base_path)s/metro/metrotestharness.exe', 16:17:29 INFO - 'minidump_stackwalk_path': 'win32-minidump_stackwalk.exe', 16:17:29 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/win32/releng.manifest', 16:17:29 INFO - 'opt_config_files': (), 16:17:29 INFO - 'pip_index': False, 16:17:29 INFO - 'sps_profile': False, 16:17:29 INFO - 'sps_profile_interval': 0, 16:17:29 INFO - 'suite': 'dromaeojs', 16:17:29 INFO - 'system_bits': '64', 16:17:29 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 16:17:29 INFO - 'title': 'T-W864-IX-155', 16:17:29 INFO - 'use_talos_json': True, 16:17:29 INFO - 'virtualenv_modules': ('pywin32', 'talos', 'mozinstall'), 16:17:29 INFO - 'virtualenv_path': 'C:\\slave\\test\\build/venv', 16:17:29 INFO - 'virtualenv_python_dll': 'c:/mozilla-build/python27/python27.dll', 16:17:29 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 16:17:29 INFO - 'work_dir': 'build'} 16:17:29 INFO - ##### 16:17:29 INFO - ##### Running clobber step. 16:17:29 INFO - ##### 16:17:29 INFO - Running pre-action listener: _resource_record_pre_action 16:17:29 INFO - Running main action method: clobber 16:17:29 INFO - rmtree: C:\slave\test\build 16:17:29 INFO - Using _rmtree_windows ... 16:17:29 INFO - retry: Calling _rmtree_windows with args: ('C:\\slave\\test\\build',), kwargs: {}, attempt #1 16:19:06 INFO - Running post-action listener: _resource_record_post_action 16:19:06 INFO - ##### 16:19:06 INFO - ##### Running read-buildbot-config step. 16:19:06 INFO - ##### 16:19:06 INFO - Running pre-action listener: _resource_record_pre_action 16:19:06 INFO - Running main action method: read_buildbot_config 16:19:06 INFO - Using buildbot properties: 16:19:06 INFO - { 16:19:06 INFO - "properties": { 16:19:06 INFO - "buildnumber": 702, 16:19:06 INFO - "product": "firefox", 16:19:06 INFO - "script_repo_revision": "production", 16:19:06 INFO - "builddir": "fx-team_win8_64_test-dromaeojs", 16:19:06 INFO - "repository": "", 16:19:06 INFO - "buildername": "Windows 8 64-bit fx-team talos dromaeojs", 16:19:06 INFO - "buildid": "20151022143900", 16:19:06 INFO - "slavename": "t-w864-ix-155", 16:19:06 INFO - "pgo_build": "False", 16:19:06 INFO - "basedir": "C:\\slave\\test", 16:19:06 INFO - "project": "", 16:19:06 INFO - "platform": "win8_64", 16:19:06 INFO - "master": "http://buildbot-master112.bb.releng.scl3.mozilla.com:8201/", 16:19:06 INFO - "slavebuilddir": "test", 16:19:06 INFO - "scheduler": "tests-fx-team-win64-talos", 16:19:06 INFO - "branch": "fx-team", 16:19:06 INFO - "repo_path": "integration/fx-team", 16:19:06 INFO - "stage_platform": "win64", 16:19:06 INFO - "builduid": "a04a2170117e4679aa1c82167f293edb", 16:19:06 INFO - "revision": "ddb5b8e191c9e6cd1f8f1b6c7524eab20747a402" 16:19:06 INFO - }, 16:19:06 INFO - "sourcestamp": { 16:19:06 INFO - "repository": "", 16:19:06 INFO - "hasPatch": false, 16:19:06 INFO - "project": "", 16:19:06 INFO - "branch": "fx-team-win64-talos", 16:19:06 INFO - "changes": [ 16:19:06 INFO - { 16:19:06 INFO - "category": null, 16:19:06 INFO - "files": [ 16:19:06 INFO - { 16:19:06 INFO - "url": null, 16:19:06 INFO - "name": "https://queue.taskcluster.net/v1/task/lUgcNblFQ5mf-T41YEPb_Q/artifacts/public/build/firefox-44.0a1.en-US.win64.zip" 16:19:06 INFO - } 16:19:06 INFO - ], 16:19:06 INFO - "repository": "", 16:19:06 INFO - "rev": "ddb5b8e191c9e6cd1f8f1b6c7524eab20747a402", 16:19:06 INFO - "who": "mhammond@skippinet.com.au", 16:19:06 INFO - "when": 1445555425, 16:19:06 INFO - "number": 6562116, 16:19:06 INFO - "comments": "Bug 1205928 - update the Sync migration code to automatically and unconditionally disconnect from legacy Sync. r=adw", 16:19:06 INFO - "project": "", 16:19:06 INFO - "at": "Thu 22 Oct 2015 16:10:25", 16:19:06 INFO - "branch": "fx-team-win64-talos", 16:19:06 INFO - "revlink": "", 16:19:06 INFO - "properties": [ 16:19:06 INFO - [ 16:19:06 INFO - "buildid", 16:19:06 INFO - "20151022143900", 16:19:06 INFO - "Change" 16:19:06 INFO - ], 16:19:06 INFO - [ 16:19:06 INFO - "builduid", 16:19:06 INFO - "a04a2170117e4679aa1c82167f293edb", 16:19:06 INFO - "Change" 16:19:06 INFO - ], 16:19:06 INFO - [ 16:19:06 INFO - "pgo_build", 16:19:06 INFO - "False", 16:19:06 INFO - "Change" 16:19:06 INFO - ] 16:19:06 INFO - ], 16:19:06 INFO - "revision": "ddb5b8e191c9e6cd1f8f1b6c7524eab20747a402" 16:19:06 INFO - } 16:19:06 INFO - ], 16:19:06 INFO - "revision": "ddb5b8e191c9e6cd1f8f1b6c7524eab20747a402" 16:19:06 INFO - } 16:19:06 INFO - } 16:19:06 INFO - Found installer url https://queue.taskcluster.net/v1/task/lUgcNblFQ5mf-T41YEPb_Q/artifacts/public/build/firefox-44.0a1.en-US.win64.zip. 16:19:06 INFO - Running post-action listener: _resource_record_post_action 16:19:06 INFO - ##### 16:19:06 INFO - ##### Running download-and-extract step. 16:19:06 INFO - ##### 16:19:06 INFO - Running pre-action listener: _resource_record_pre_action 16:19:06 INFO - Running main action method: download_and_extract 16:19:06 INFO - mkdir: C:\slave\test\build\tests 16:19:06 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 16:19:06 INFO - https://queue.taskcluster.net/v1/task/lUgcNblFQ5mf-T41YEPb_Q/artifacts/public/build/test_packages.json matches https://queue.taskcluster.net 16:19:06 INFO - trying https://queue.taskcluster.net/v1/task/lUgcNblFQ5mf-T41YEPb_Q/artifacts/public/build/test_packages.json 16:19:06 INFO - Downloading https://queue.taskcluster.net/v1/task/lUgcNblFQ5mf-T41YEPb_Q/artifacts/public/build/test_packages.json to C:\slave\test\build\test_packages.json 16:19:06 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/lUgcNblFQ5mf-T41YEPb_Q/artifacts/public/build/test_packages.json', 'file_name': 'C:\\slave\\test\\build\\test_packages.json'}, attempt #1 16:19:08 INFO - Downloaded 1221 bytes. 16:19:08 INFO - Reading from file C:\slave\test\build\test_packages.json 16:19:08 INFO - Using the following test package requirements: 16:19:08 INFO - {u'common': [u'firefox-44.0a1.en-US.win64.common.tests.zip'], 16:19:08 INFO - u'cppunittest': [u'firefox-44.0a1.en-US.win64.common.tests.zip', 16:19:08 INFO - u'firefox-44.0a1.en-US.win64.cppunittest.tests.zip'], 16:19:08 INFO - u'jittest': [u'firefox-44.0a1.en-US.win64.common.tests.zip', 16:19:08 INFO - u'jsshell-win64.zip'], 16:19:08 INFO - u'mochitest': [u'firefox-44.0a1.en-US.win64.common.tests.zip', 16:19:08 INFO - u'firefox-44.0a1.en-US.win64.mochitest.tests.zip'], 16:19:08 INFO - u'mozbase': [u'firefox-44.0a1.en-US.win64.common.tests.zip'], 16:19:08 INFO - u'reftest': [u'firefox-44.0a1.en-US.win64.common.tests.zip', 16:19:08 INFO - u'firefox-44.0a1.en-US.win64.reftest.tests.zip'], 16:19:08 INFO - u'talos': [u'firefox-44.0a1.en-US.win64.common.tests.zip', 16:19:08 INFO - u'firefox-44.0a1.en-US.win64.talos.tests.zip'], 16:19:08 INFO - u'web-platform': [u'firefox-44.0a1.en-US.win64.common.tests.zip', 16:19:08 INFO - u'firefox-44.0a1.en-US.win64.web-platform.tests.zip'], 16:19:08 INFO - u'webapprt': [u'firefox-44.0a1.en-US.win64.common.tests.zip'], 16:19:08 INFO - u'xpcshell': [u'firefox-44.0a1.en-US.win64.common.tests.zip', 16:19:08 INFO - u'firefox-44.0a1.en-US.win64.xpcshell.tests.zip']} 16:19:08 INFO - Downloading packages: [u'firefox-44.0a1.en-US.win64.common.tests.zip'] for test suite category: common 16:19:08 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 16:19:08 INFO - https://queue.taskcluster.net/v1/task/lUgcNblFQ5mf-T41YEPb_Q/artifacts/public/build/firefox-44.0a1.en-US.win64.common.tests.zip matches https://queue.taskcluster.net 16:19:08 INFO - trying https://queue.taskcluster.net/v1/task/lUgcNblFQ5mf-T41YEPb_Q/artifacts/public/build/firefox-44.0a1.en-US.win64.common.tests.zip 16:19:08 INFO - Downloading https://queue.taskcluster.net/v1/task/lUgcNblFQ5mf-T41YEPb_Q/artifacts/public/build/firefox-44.0a1.en-US.win64.common.tests.zip to C:\slave\test\build\firefox-44.0a1.en-US.win64.common.tests.zip 16:19:08 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/lUgcNblFQ5mf-T41YEPb_Q/artifacts/public/build/firefox-44.0a1.en-US.win64.common.tests.zip', 'file_name': u'C:\\slave\\test\\build\\firefox-44.0a1.en-US.win64.common.tests.zip'}, attempt #1 ProcessManager NOT managing child processes 16:19:15 INFO - Downloaded 18097108 bytes. 16:19:15 INFO - Running command: ['unzip', '-q', '-o', u'C:\\slave\\test\\build\\firefox-44.0a1.en-US.win64.common.tests.zip'] in C:\slave\test\build\tests 16:19:15 INFO - Copy/paste: unzip -q -o C:\slave\test\build\firefox-44.0a1.en-US.win64.common.tests.zip 16:19:15 INFO - Calling ['unzip', '-q', '-o', u'C:\\slave\\test\\build\\firefox-44.0a1.en-US.win64.common.tests.zip'] with output_timeout 1760 ProcessManager UNABLE to use job objects to manage child processes 16:19:55 INFO - Return code: 0 16:19:55 INFO - Downloading packages: [u'firefox-44.0a1.en-US.win64.common.tests.zip', u'firefox-44.0a1.en-US.win64.talos.tests.zip'] for test suite category: talos 16:19:55 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 16:19:55 INFO - https://queue.taskcluster.net/v1/task/lUgcNblFQ5mf-T41YEPb_Q/artifacts/public/build/firefox-44.0a1.en-US.win64.common.tests.zip matches https://queue.taskcluster.net 16:19:55 INFO - trying https://queue.taskcluster.net/v1/task/lUgcNblFQ5mf-T41YEPb_Q/artifacts/public/build/firefox-44.0a1.en-US.win64.common.tests.zip 16:19:55 INFO - Downloading https://queue.taskcluster.net/v1/task/lUgcNblFQ5mf-T41YEPb_Q/artifacts/public/build/firefox-44.0a1.en-US.win64.common.tests.zip to C:\slave\test\build\firefox-44.0a1.en-US.win64.common.tests.zip 16:19:55 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/lUgcNblFQ5mf-T41YEPb_Q/artifacts/public/build/firefox-44.0a1.en-US.win64.common.tests.zip', 'file_name': u'C:\\slave\\test\\build\\firefox-44.0a1.en-US.win64.common.tests.zip'}, attempt #1 ProcessManager NOT managing child processes 16:20:04 INFO - Downloaded 18097108 bytes. 16:20:04 INFO - Running command: ['unzip', '-q', '-o', u'C:\\slave\\test\\build\\firefox-44.0a1.en-US.win64.common.tests.zip'] in C:\slave\test\build\tests 16:20:04 INFO - Copy/paste: unzip -q -o C:\slave\test\build\firefox-44.0a1.en-US.win64.common.tests.zip 16:20:04 INFO - Calling ['unzip', '-q', '-o', u'C:\\slave\\test\\build\\firefox-44.0a1.en-US.win64.common.tests.zip'] with output_timeout 1760 ProcessManager UNABLE to use job objects to manage child processes 16:20:29 INFO - Return code: 0 16:20:29 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 16:20:29 INFO - https://queue.taskcluster.net/v1/task/lUgcNblFQ5mf-T41YEPb_Q/artifacts/public/build/firefox-44.0a1.en-US.win64.talos.tests.zip matches https://queue.taskcluster.net 16:20:29 INFO - trying https://queue.taskcluster.net/v1/task/lUgcNblFQ5mf-T41YEPb_Q/artifacts/public/build/firefox-44.0a1.en-US.win64.talos.tests.zip 16:20:29 INFO - Downloading https://queue.taskcluster.net/v1/task/lUgcNblFQ5mf-T41YEPb_Q/artifacts/public/build/firefox-44.0a1.en-US.win64.talos.tests.zip to C:\slave\test\build\firefox-44.0a1.en-US.win64.talos.tests.zip 16:20:29 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/lUgcNblFQ5mf-T41YEPb_Q/artifacts/public/build/firefox-44.0a1.en-US.win64.talos.tests.zip', 'file_name': u'C:\\slave\\test\\build\\firefox-44.0a1.en-US.win64.talos.tests.zip'}, attempt #1 ProcessManager NOT managing child processes 16:20:43 INFO - Downloaded 11131307 bytes. 16:20:43 INFO - Running command: ['unzip', '-q', '-o', u'C:\\slave\\test\\build\\firefox-44.0a1.en-US.win64.talos.tests.zip'] in C:\slave\test\build\tests 16:20:43 INFO - Copy/paste: unzip -q -o C:\slave\test\build\firefox-44.0a1.en-US.win64.talos.tests.zip 16:20:43 INFO - Calling ['unzip', '-q', '-o', u'C:\\slave\\test\\build\\firefox-44.0a1.en-US.win64.talos.tests.zip'] with output_timeout 1760 ProcessManager UNABLE to use job objects to manage child processes 16:20:43 INFO - Return code: 0 16:20:43 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 16:20:43 INFO - https://queue.taskcluster.net/v1/task/lUgcNblFQ5mf-T41YEPb_Q/artifacts/public/build/firefox-44.0a1.en-US.win64.zip matches https://queue.taskcluster.net 16:20:43 INFO - trying https://queue.taskcluster.net/v1/task/lUgcNblFQ5mf-T41YEPb_Q/artifacts/public/build/firefox-44.0a1.en-US.win64.zip 16:20:43 INFO - Downloading https://queue.taskcluster.net/v1/task/lUgcNblFQ5mf-T41YEPb_Q/artifacts/public/build/firefox-44.0a1.en-US.win64.zip to C:\slave\test\build\firefox-44.0a1.en-US.win64.zip 16:20:43 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/lUgcNblFQ5mf-T41YEPb_Q/artifacts/public/build/firefox-44.0a1.en-US.win64.zip', 'file_name': 'C:\\slave\\test\\build\\firefox-44.0a1.en-US.win64.zip'}, attempt #1 16:20:47 INFO - Downloaded 54755978 bytes. 16:20:47 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/lUgcNblFQ5mf-T41YEPb_Q/artifacts/public/build/firefox-44.0a1.en-US.win64.zip 16:20:47 INFO - mkdir: C:\slave\test\properties 16:20:47 INFO - Writing buildbot properties ['build_url'] to C:\slave\test\properties\build_url 16:20:47 INFO - Writing to file C:\slave\test\properties\build_url 16:20:47 INFO - Contents: 16:20:47 INFO - build_url:https://queue.taskcluster.net/v1/task/lUgcNblFQ5mf-T41YEPb_Q/artifacts/public/build/firefox-44.0a1.en-US.win64.zip 16:20:47 INFO - Running post-action listener: _resource_record_post_action 16:20:47 INFO - Running post-action listener: set_extra_try_arguments 16:20:47 INFO - ##### 16:20:47 INFO - ##### Running populate-webroot step. 16:20:47 INFO - ##### 16:20:47 INFO - Running pre-action listener: _resource_record_pre_action 16:20:47 INFO - Running main action method: populate_webroot 16:20:47 INFO - Guessing talos json url... 16:20:47 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 16:20:47 INFO - https://queue.taskcluster.net/v1/task/lUgcNblFQ5mf-T41YEPb_Q/artifacts/public/build/firefox-44.0a1.en-US.win64.txt matches https://queue.taskcluster.net 16:20:47 INFO - trying https://queue.taskcluster.net/v1/task/lUgcNblFQ5mf-T41YEPb_Q/artifacts/public/build/firefox-44.0a1.en-US.win64.txt 16:20:47 INFO - Downloading https://queue.taskcluster.net/v1/task/lUgcNblFQ5mf-T41YEPb_Q/artifacts/public/build/firefox-44.0a1.en-US.win64.txt to C:\slave\test\build\firefox-44.0a1.en-US.win64.txt 16:20:47 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/lUgcNblFQ5mf-T41YEPb_Q/artifacts/public/build/firefox-44.0a1.en-US.win64.txt', 'file_name': 'C:\\slave\\test\\build\\firefox-44.0a1.en-US.win64.txt'}, attempt #1 16:20:49 INFO - Downloaded 103 bytes. 16:20:49 INFO - Reading from file C:\slave\test\build\firefox-44.0a1.en-US.win64.txt 16:20:49 INFO - Contents: 16:20:49 INFO - 20151022143900 16:20:49 INFO - https://hg.mozilla.org/integration/fx-team/rev/ddb5b8e191c9e6cd1f8f1b6c7524eab20747a402 16:20:49 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 16:20:49 INFO - trying https://hg.mozilla.org/integration/fx-team/raw-file/ddb5b8e191/testing/talos/talos.json 16:20:49 INFO - Downloading https://hg.mozilla.org/integration/fx-team/raw-file/ddb5b8e191/testing/talos/talos.json to C:\slave\test\build\talos.json 16:20:49 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://hg.mozilla.org/integration/fx-team/raw-file/ddb5b8e191/testing/talos/talos.json', 'file_name': 'C:\\slave\\test\\build\\talos.json'}, attempt #1 16:20:50 INFO - Downloaded 4264 bytes. 16:20:50 INFO - {u'extra_options': {u'android': [u'--apkPath=%(apk_path)s']}, 16:20:50 INFO - u'mobile-suites': {u'remote-tp4m_nochrome': {u'tests': [u'tp4m']}, 16:20:50 INFO - u'remote-trobocheck2': {u'talos_options': [u'--fennecIDs', 16:20:50 INFO - u'../fennec_ids.txt'], 16:20:50 INFO - u'tests': [u'tcheck2']}, 16:20:50 INFO - u'remote-tsvgx': {u'talos_options': [u'--noChrome', 16:20:50 INFO - u'--tppagecycles', 16:20:50 INFO - u'7'], 16:20:50 INFO - u'tests': [u'tsvgm']}}, 16:20:50 INFO - u'suites': {u'chromez': {u'tests': [u'tresize', u'tcanvasmark']}, 16:20:50 INFO - u'chromez-e10s': {u'talos_options': [u'--e10s'], 16:20:50 INFO - u'tests': [u'tresize', u'tcanvasmark']}, 16:20:50 INFO - u'dromaeojs': {u'tests': [u'dromaeo_css', u'kraken', u'v8_7']}, 16:20:50 INFO - u'dromaeojs-e10s': {u'talos_options': [u'--e10s'], 16:20:50 INFO - u'tests': [u'dromaeo_css', 16:20:50 INFO - u'kraken', 16:20:50 INFO - u'v8_7']}, 16:20:50 INFO - u'g1': {u'pagesets_url': u'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 16:20:50 INFO - u'tests': [u'tp5o_scroll', u'glterrain']}, 16:20:50 INFO - u'g1-e10s': {u'pagesets_url': u'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 16:20:50 INFO - u'talos_options': [u'--e10s'], 16:20:50 INFO - u'tests': [u'tp5o_scroll', u'glterrain']}, 16:20:50 INFO - u'g2': {u'pagesets_url': u'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 16:20:50 INFO - u'tests': [u'damp', u'tps']}, 16:20:50 INFO - u'g2-e10s': {u'pagesets_url': u'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 16:20:50 INFO - u'talos_options': [u'--e10s'], 16:20:50 INFO - u'tests': [u'damp', u'tps']}, 16:20:50 INFO - u'g3': {u'tests': [u'dromaeo_dom']}, 16:20:50 INFO - u'g3-e10s': {u'tests': [u'dromaeo_dom']}, 16:20:50 INFO - u'other': {u'tests': [u'a11yr', 16:20:50 INFO - u'ts_paint', 16:20:50 INFO - u'tpaint', 16:20:50 INFO - u'sessionrestore', 16:20:50 INFO - u'sessionrestore_no_auto_restore']}, 16:20:50 INFO - u'other-e10s': {u'talos_options': [u'--e10s'], 16:20:50 INFO - u'tests': [u'a11yr', 16:20:50 INFO - u'ts_paint', 16:20:50 INFO - u'tpaint', 16:20:50 INFO - u'sessionrestore', 16:20:50 INFO - u'sessionrestore_no_auto_restore']}, 16:20:50 INFO - u'other-e10s_l64': {u'talos_options': [u'--e10s'], 16:20:50 INFO - u'tests': [u'a11yr', 16:20:50 INFO - u'ts_paint', 16:20:50 INFO - u'tpaint', 16:20:50 INFO - u'sessionrestore', 16:20:50 INFO - u'sessionrestore_no_auto_restore']}, 16:20:50 INFO - u'other-e10s_nol64': {u'talos_options': [u'--e10s'], 16:20:50 INFO - u'tests': [u'a11yr', 16:20:50 INFO - u'ts_paint', 16:20:50 INFO - u'tpaint', 16:20:50 INFO - u'sessionrestore', 16:20:50 INFO - u'sessionrestore_no_auto_restore']}, 16:20:50 INFO - u'other_l64': {u'tests': [u'a11yr', 16:20:50 INFO - u'ts_paint', 16:20:50 INFO - u'tpaint', 16:20:50 INFO - u'sessionrestore', 16:20:50 INFO - u'sessionrestore_no_auto_restore']}, 16:20:50 INFO - u'other_nol64': {u'tests': [u'a11yr', 16:20:50 INFO - u'ts_paint', 16:20:50 INFO - u'tpaint', 16:20:50 INFO - u'sessionrestore', 16:20:50 INFO - u'sessionrestore_no_auto_restore']}, 16:20:50 INFO - u'svgr': {u'tests': [u'tsvgx', 16:20:50 INFO - u'tsvgr_opacity', 16:20:50 INFO - u'tart', 16:20:50 INFO - u'tscrollx', 16:20:50 INFO - u'cart']}, 16:20:50 INFO - u'svgr-e10s': {u'talos_options': [u'--e10s'], 16:20:50 INFO - u'tests': [u'tsvgx', 16:20:50 INFO - u'tsvgr_opacity', 16:20:50 INFO - u'tart', 16:20:50 INFO - u'tscrollx', 16:20:50 INFO - u'cart']}, 16:20:50 INFO - u'tp5o': {u'pagesets_url': u'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 16:20:50 INFO - u'tests': [u'tp5o']}, 16:20:50 INFO - u'tp5o-e10s': {u'pagesets_url': u'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 16:20:50 INFO - u'talos_options': [u'--e10s'], 16:20:50 INFO - u'tests': [u'tp5o']}, 16:20:50 INFO - u'xperf': {u'pagesets_url': u'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 16:20:50 INFO - u'talos_options': [u'--xperf_path', 16:20:50 INFO - u'"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 16:20:50 INFO - u'tests': [u'tp5n']}, 16:20:50 INFO - u'xperf-e10s': {u'pagesets_url': u'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 16:20:50 INFO - u'talos_options': [u'--e10s', 16:20:50 INFO - u'--xperf_path', 16:20:50 INFO - u'"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"', 16:20:50 INFO - u'C:/slave/talos-data/talos/xperf.config'], 16:20:50 INFO - u'tests': [u'tp5n']}}, 16:20:50 INFO - u'talos.zip': {u'path': u'', 16:20:50 INFO - u'url': u'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 16:20:50 INFO - Running post-action listener: _resource_record_post_action 16:20:50 INFO - ##### 16:20:50 INFO - ##### Running create-virtualenv step. 16:20:50 INFO - ##### 16:20:50 INFO - Running pre-action listener: _resource_record_pre_action 16:20:50 INFO - Running main action method: create_virtualenv 16:20:50 INFO - Creating virtualenv C:\slave\test\build/venv 16:20:50 INFO - mkdir: C:\slave\test\build\venv\Scripts 16:20:50 INFO - Copying c:/mozilla-build/python27/python27.dll to C:\slave\test\build\venv\Scripts\python27.dll 16:20:50 WARNING - Can't copy c:/mozilla-build/python27/python27.dll to C:\slave\test\build\venv\Scripts\python27.dll: [Errno 2] No such file or directory: 'c:/mozilla-build/python27/python27.dll'! 16:20:50 INFO - Running command: ['c:/mozilla-build/python27/python.exe', 'c:/mozilla-build/buildbotve/virtualenv.py', '--no-site-packages', '--distribute', 'C:\\slave\\test\\build/venv'] in C:\slave\test\build 16:20:50 INFO - Copy/paste: c:/mozilla-build/python27/python.exe c:/mozilla-build/buildbotve/virtualenv.py --no-site-packages --distribute C:\slave\test\build/venv 16:20:52 INFO - New python executable in C:\slave\test\build/venv\Scripts\python.exe 16:20:55 INFO - Installing distribute......................................................................................................................................................................................done. 16:20:57 INFO - Return code: 0 16:20:57 INFO - Installing pip>=1.5 into virtualenv C:\slave\test\build/venv 16:20:57 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 16:20:57 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 16:20:57 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 16:20:57 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 16:20:57 INFO - retry: Calling run_command with args: [['C:\\slave\\test\\build\\venv\\Scripts\\pip', 'install', '--download-cache', 'C:\\slave\\test\\build/venv\\cache', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x023AFB10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x02371EA8>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x02449A90>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x01D98B48>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x01DBA700>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x0242A660>, 'level': 'critical'}], 'cwd': 'C:\\slave\\test\\build', 'env': {'TMP': 'C:\\Users\\CLTBLD~1.T-W\\AppData\\Local\\Temp', 'TEST1': 'testie', 'COMPUTERNAME': 'T-W864-IX-155', 'USERDOMAIN': 'T-W864-IX-155', 'KTS_VERSION': '1.19c', 'PSMODULEPATH': 'C:\\windows\\system32\\WindowsPowerShell\\v1.0\\Modules\\', 'COMMONPROGRAMFILES': 'C:\\Program Files (x86)\\Common Files', 'PROCESSOR_IDENTIFIER': 'Intel64 Family 6 Model 30 Stepping 5, GenuineIntel', 'PROGRAMFILES': 'C:\\Program Files (x86)', 'PROCESSOR_REVISION': '1e05', 'DNSSUFFIX': 'wintest.releng.scl3.mozilla.com', 'SYSTEMROOT': 'C:\\windows', 'NO_EM_RESTART': '1', 'PROGRAMFILES(X86)': 'C:\\Program Files (x86)', 'OURDRIVE': 'C:', 'XPCOM_DEBUG_BREAK': 'warn', 'MONDIR': 'C:\\Monitor_config\\', 'TEMP': 'C:\\Users\\CLTBLD~1.T-W\\AppData\\Local\\Temp', 'COMMONPROGRAMFILES(X86)': 'C:\\Program Files (x86)\\Common Files', 'RUNLOGFILE': 'C:\\slave\\\\runslave.log', 'PROCESSOR_ARCHITECTURE': 'x86', 'ALLUSERSPROFILE': 'C:\\ProgramData', 'USERPROFILE': 'C:\\Users\\cltbld.T-W864-IX-155', 'LOCALAPPDATA': 'C:\\Users\\cltbld.T-W864-IX-155\\AppData\\Local', 'HOMEPATH': '\\Users\\cltbld.T-W864-IX-155', 'USERDOMAIN_ROAMINGPROFILE': 'T-W864-IX-155', 'MOZBUILDDIR': 'C:\\mozilla-build\\', 'PROGRAMW6432': 'C:\\Program Files', 'USERNAME': 'cltbld', 'LOGONSERVER': '\\\\T-W864-IX-155', 'MOZ_NO_REMOTE': '1', 'COMSPEC': 'C:\\windows\\system32\\cmd.exe', 'PROGRAMDATA': 'C:\\ProgramData', 'PROPERTIES_FILE': 'C:\\slave\\test/buildprops.json', 'PATH': 'C:\\Program Files (x86)\\NVIDIA Corporation\\PhysX\\Common;C:\\windows\\system32;C:\\windows;C:\\windows\\System32\\Wbem;C:\\windows\\System32\\WindowsPowerShell\\v1.0\\;C:\\mozilla-build\\python27;C:\\mozilla-build\\python27\\Scripts;C:\\mozilla-build\\msys\\bin;C:\\mozilla-build\\vim\\vim72;C:\\mozilla-build\\wget;C:\\mozilla-build\\info-zip;C:\\CoreUtils\\bin;C:\\mozilla-build\\buildbotve\\scripts;C:\\mozilla-build\\hg', 'PROMPT': '$P$G', 'PATHEXT': '.COM;.EXE;.BAT;.CMD;.VBS;.VBE;.JS;.JSE;.WSF;.WSH;.MSC', 'FP_NO_HOST_CHECK': 'NO', 'DCLOCATION': 'SCL3', 'APPDATA': 'C:\\Users\\cltbld.T-W864-IX-155\\AppData\\Roaming', 'HOMEDRIVE': 'C:', 'SYSTEMDRIVE': 'C:', 'SLAVEDIR': 'C:\\slave\\', 'NUMBER_OF_PROCESSORS': '8', 'PWD': 'C:\\slave\\test', 'PROCESSOR_LEVEL': '6', 'KTS_HOME': 'C:\\Program Files\\KTS', 'PROCESSOR_ARCHITEW6432': 'AMD64', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'COMMONPROGRAMW6432': 'C:\\Program Files\\Common Files', 'OS': 'Windows_NT', 'PUBLIC': 'C:\\Users\\Public', 'WINDIR': 'C:\\windows'}}, attempt #1 16:20:57 INFO - Running command: ['C:\\slave\\test\\build\\venv\\Scripts\\pip', 'install', '--download-cache', 'C:\\slave\\test\\build/venv\\cache', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5'] in C:\slave\test\build 16:20:57 INFO - Copy/paste: C:\slave\test\build\venv\Scripts\pip install --download-cache C:\slave\test\build/venv\cache --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub pip>=1.5 16:20:57 INFO - Using env: {'ALLUSERSPROFILE': 'C:\\ProgramData', 16:20:57 INFO - 'APPDATA': 'C:\\Users\\cltbld.T-W864-IX-155\\AppData\\Roaming', 16:20:57 INFO - 'COMMONPROGRAMFILES': 'C:\\Program Files (x86)\\Common Files', 16:20:57 INFO - 'COMMONPROGRAMFILES(X86)': 'C:\\Program Files (x86)\\Common Files', 16:20:57 INFO - 'COMMONPROGRAMW6432': 'C:\\Program Files\\Common Files', 16:20:57 INFO - 'COMPUTERNAME': 'T-W864-IX-155', 16:20:57 INFO - 'COMSPEC': 'C:\\windows\\system32\\cmd.exe', 16:20:57 INFO - 'DCLOCATION': 'SCL3', 16:20:57 INFO - 'DNSSUFFIX': 'wintest.releng.scl3.mozilla.com', 16:20:57 INFO - 'FP_NO_HOST_CHECK': 'NO', 16:20:57 INFO - 'HOMEDRIVE': 'C:', 16:20:57 INFO - 'HOMEPATH': '\\Users\\cltbld.T-W864-IX-155', 16:20:57 INFO - 'KTS_HOME': 'C:\\Program Files\\KTS', 16:20:57 INFO - 'KTS_VERSION': '1.19c', 16:20:57 INFO - 'LOCALAPPDATA': 'C:\\Users\\cltbld.T-W864-IX-155\\AppData\\Local', 16:20:57 INFO - 'LOGONSERVER': '\\\\T-W864-IX-155', 16:20:57 INFO - 'MONDIR': 'C:\\Monitor_config\\', 16:20:57 INFO - 'MOZBUILDDIR': 'C:\\mozilla-build\\', 16:20:57 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:20:57 INFO - 'MOZ_NO_REMOTE': '1', 16:20:57 INFO - 'NO_EM_RESTART': '1', 16:20:57 INFO - 'NUMBER_OF_PROCESSORS': '8', 16:20:57 INFO - 'OS': 'Windows_NT', 16:20:57 INFO - 'OURDRIVE': 'C:', 16:20:57 INFO - 'PATH': 'C:\\Program Files (x86)\\NVIDIA Corporation\\PhysX\\Common;C:\\windows\\system32;C:\\windows;C:\\windows\\System32\\Wbem;C:\\windows\\System32\\WindowsPowerShell\\v1.0\\;C:\\mozilla-build\\python27;C:\\mozilla-build\\python27\\Scripts;C:\\mozilla-build\\msys\\bin;C:\\mozilla-build\\vim\\vim72;C:\\mozilla-build\\wget;C:\\mozilla-build\\info-zip;C:\\CoreUtils\\bin;C:\\mozilla-build\\buildbotve\\scripts;C:\\mozilla-build\\hg', 16:20:57 INFO - 'PATHEXT': '.COM;.EXE;.BAT;.CMD;.VBS;.VBE;.JS;.JSE;.WSF;.WSH;.MSC', 16:20:57 INFO - 'PROCESSOR_ARCHITECTURE': 'x86', 16:20:57 INFO - 'PROCESSOR_ARCHITEW6432': 'AMD64', 16:20:57 INFO - 'PROCESSOR_IDENTIFIER': 'Intel64 Family 6 Model 30 Stepping 5, GenuineIntel', 16:20:57 INFO - 'PROCESSOR_LEVEL': '6', 16:20:57 INFO - 'PROCESSOR_REVISION': '1e05', 16:20:57 INFO - 'PROGRAMDATA': 'C:\\ProgramData', 16:20:57 INFO - 'PROGRAMFILES': 'C:\\Program Files (x86)', 16:20:57 INFO - 'PROGRAMFILES(X86)': 'C:\\Program Files (x86)', 16:20:57 INFO - 'PROGRAMW6432': 'C:\\Program Files', 16:20:57 INFO - 'PROMPT': '$P$G', 16:20:57 INFO - 'PROPERTIES_FILE': 'C:\\slave\\test/buildprops.json', 16:20:57 INFO - 'PSMODULEPATH': 'C:\\windows\\system32\\WindowsPowerShell\\v1.0\\Modules\\', 16:20:57 INFO - 'PUBLIC': 'C:\\Users\\Public', 16:20:57 INFO - 'PWD': 'C:\\slave\\test', 16:20:57 INFO - 'RUNLOGFILE': 'C:\\slave\\\\runslave.log', 16:20:57 INFO - 'SLAVEDIR': 'C:\\slave\\', 16:20:57 INFO - 'SYSTEMDRIVE': 'C:', 16:20:57 INFO - 'SYSTEMROOT': 'C:\\windows', 16:20:57 INFO - 'TEMP': 'C:\\Users\\CLTBLD~1.T-W\\AppData\\Local\\Temp', 16:20:57 INFO - 'TEST1': 'testie', 16:20:57 INFO - 'TMP': 'C:\\Users\\CLTBLD~1.T-W\\AppData\\Local\\Temp', 16:20:57 INFO - 'USERDOMAIN': 'T-W864-IX-155', 16:20:57 INFO - 'USERDOMAIN_ROAMINGPROFILE': 'T-W864-IX-155', 16:20:57 INFO - 'USERNAME': 'cltbld', 16:20:57 INFO - 'USERPROFILE': 'C:\\Users\\cltbld.T-W864-IX-155', 16:20:57 INFO - 'WINDIR': 'C:\\windows', 16:20:57 INFO - 'XPCOM_DEBUG_BREAK': 'warn'} 16:21:01 INFO - Ignoring indexes: http://pypi.python.org/simple/ 16:21:01 INFO - Downloading/unpacking pip>=1.5 16:21:01 INFO - Creating supposed download cache at C:\slave\test\build/venv\cache 16:21:12 INFO - Storing download in cache at c:\slave\test\build\venv\cache\http%3a%2f%2fpypi.pub.build.mozilla.org%2fpub%2fpip-1.5.5.tar.gz 16:21:12 INFO - Running setup.py egg_info for package pip 16:21:12 INFO - warning: no files found matching 'pip\cacert.pem' 16:21:12 INFO - warning: no files found matching '*.html' under directory 'docs' 16:21:12 INFO - warning: no previously-included files matching '*.rst' found under directory 'docs\_build' 16:21:12 INFO - no previously-included directories found matching 'docs\_build\_sources' 16:21:12 INFO - Installing collected packages: pip 16:21:12 INFO - Found existing installation: pip 0.8.2 16:21:12 INFO - Uninstalling pip: 16:21:12 INFO - Successfully uninstalled pip 16:21:12 INFO - Running setup.py install for pip 16:21:12 INFO - warning: no files found matching 'pip\cacert.pem' 16:21:12 INFO - warning: no files found matching '*.html' under directory 'docs' 16:21:12 INFO - warning: no previously-included files matching '*.rst' found under directory 'docs\_build' 16:21:12 INFO - no previously-included directories found matching 'docs\_build\_sources' 16:21:12 INFO - Installing pip-script.py script to C:\slave\test\build\venv\Scripts 16:21:12 INFO - Installing pip.exe script to C:\slave\test\build\venv\Scripts 16:21:12 INFO - Installing pip2.7-script.py script to C:\slave\test\build\venv\Scripts 16:21:12 INFO - Installing pip2.7.exe script to C:\slave\test\build\venv\Scripts 16:21:12 INFO - Installing pip2-script.py script to C:\slave\test\build\venv\Scripts 16:21:12 INFO - Installing pip2.exe script to C:\slave\test\build\venv\Scripts 16:21:12 INFO - Successfully installed pip 16:21:12 INFO - Cleaning up... 16:21:12 INFO - Return code: 0 16:21:12 INFO - Installing psutil>=0.7.1 into virtualenv C:\slave\test\build/venv 16:21:12 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 16:21:12 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 16:21:12 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 16:21:12 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 16:21:12 INFO - retry: Calling run_command with args: [['C:\\slave\\test\\build\\venv\\Scripts\\pip', 'install', '--download-cache', 'C:\\slave\\test\\build/venv\\cache', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=0.7.1']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x023AFB10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x02371EA8>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x02449A90>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x01D98B48>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x01DBA700>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x0242A660>, 'level': 'critical'}], 'cwd': 'C:\\slave\\test\\build', 'env': {'TMP': 'C:\\Users\\CLTBLD~1.T-W\\AppData\\Local\\Temp', 'TEST1': 'testie', 'COMPUTERNAME': 'T-W864-IX-155', 'USERDOMAIN': 'T-W864-IX-155', 'KTS_VERSION': '1.19c', 'PSMODULEPATH': 'C:\\windows\\system32\\WindowsPowerShell\\v1.0\\Modules\\', 'COMMONPROGRAMFILES': 'C:\\Program Files (x86)\\Common Files', 'PROCESSOR_IDENTIFIER': 'Intel64 Family 6 Model 30 Stepping 5, GenuineIntel', 'PROGRAMFILES': 'C:\\Program Files (x86)', 'PROCESSOR_REVISION': '1e05', 'DNSSUFFIX': 'wintest.releng.scl3.mozilla.com', 'SYSTEMROOT': 'C:\\windows', 'NO_EM_RESTART': '1', 'PROGRAMFILES(X86)': 'C:\\Program Files (x86)', 'OURDRIVE': 'C:', 'XPCOM_DEBUG_BREAK': 'warn', 'MONDIR': 'C:\\Monitor_config\\', 'TEMP': 'C:\\Users\\CLTBLD~1.T-W\\AppData\\Local\\Temp', 'COMMONPROGRAMFILES(X86)': 'C:\\Program Files (x86)\\Common Files', 'RUNLOGFILE': 'C:\\slave\\\\runslave.log', 'PROCESSOR_ARCHITECTURE': 'x86', 'ALLUSERSPROFILE': 'C:\\ProgramData', 'USERPROFILE': 'C:\\Users\\cltbld.T-W864-IX-155', 'LOCALAPPDATA': 'C:\\Users\\cltbld.T-W864-IX-155\\AppData\\Local', 'HOMEPATH': '\\Users\\cltbld.T-W864-IX-155', 'USERDOMAIN_ROAMINGPROFILE': 'T-W864-IX-155', 'MOZBUILDDIR': 'C:\\mozilla-build\\', 'PROGRAMW6432': 'C:\\Program Files', 'USERNAME': 'cltbld', 'LOGONSERVER': '\\\\T-W864-IX-155', 'MOZ_NO_REMOTE': '1', 'COMSPEC': 'C:\\windows\\system32\\cmd.exe', 'PROGRAMDATA': 'C:\\ProgramData', 'PROPERTIES_FILE': 'C:\\slave\\test/buildprops.json', 'PATH': 'C:\\Program Files (x86)\\NVIDIA Corporation\\PhysX\\Common;C:\\windows\\system32;C:\\windows;C:\\windows\\System32\\Wbem;C:\\windows\\System32\\WindowsPowerShell\\v1.0\\;C:\\mozilla-build\\python27;C:\\mozilla-build\\python27\\Scripts;C:\\mozilla-build\\msys\\bin;C:\\mozilla-build\\vim\\vim72;C:\\mozilla-build\\wget;C:\\mozilla-build\\info-zip;C:\\CoreUtils\\bin;C:\\mozilla-build\\buildbotve\\scripts;C:\\mozilla-build\\hg', 'PROMPT': '$P$G', 'PATHEXT': '.COM;.EXE;.BAT;.CMD;.VBS;.VBE;.JS;.JSE;.WSF;.WSH;.MSC', 'FP_NO_HOST_CHECK': 'NO', 'DCLOCATION': 'SCL3', 'APPDATA': 'C:\\Users\\cltbld.T-W864-IX-155\\AppData\\Roaming', 'HOMEDRIVE': 'C:', 'SYSTEMDRIVE': 'C:', 'SLAVEDIR': 'C:\\slave\\', 'NUMBER_OF_PROCESSORS': '8', 'PWD': 'C:\\slave\\test', 'PROCESSOR_LEVEL': '6', 'KTS_HOME': 'C:\\Program Files\\KTS', 'PROCESSOR_ARCHITEW6432': 'AMD64', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'COMMONPROGRAMW6432': 'C:\\Program Files\\Common Files', 'OS': 'Windows_NT', 'PUBLIC': 'C:\\Users\\Public', 'WINDIR': 'C:\\windows'}}, attempt #1 16:21:12 INFO - Running command: ['C:\\slave\\test\\build\\venv\\Scripts\\pip', 'install', '--download-cache', 'C:\\slave\\test\\build/venv\\cache', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=0.7.1'] in C:\slave\test\build 16:21:12 INFO - Copy/paste: C:\slave\test\build\venv\Scripts\pip install --download-cache C:\slave\test\build/venv\cache --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub psutil>=0.7.1 16:21:12 INFO - Using env: {'ALLUSERSPROFILE': 'C:\\ProgramData', 16:21:12 INFO - 'APPDATA': 'C:\\Users\\cltbld.T-W864-IX-155\\AppData\\Roaming', 16:21:12 INFO - 'COMMONPROGRAMFILES': 'C:\\Program Files (x86)\\Common Files', 16:21:12 INFO - 'COMMONPROGRAMFILES(X86)': 'C:\\Program Files (x86)\\Common Files', 16:21:12 INFO - 'COMMONPROGRAMW6432': 'C:\\Program Files\\Common Files', 16:21:12 INFO - 'COMPUTERNAME': 'T-W864-IX-155', 16:21:12 INFO - 'COMSPEC': 'C:\\windows\\system32\\cmd.exe', 16:21:12 INFO - 'DCLOCATION': 'SCL3', 16:21:12 INFO - 'DNSSUFFIX': 'wintest.releng.scl3.mozilla.com', 16:21:12 INFO - 'FP_NO_HOST_CHECK': 'NO', 16:21:12 INFO - 'HOMEDRIVE': 'C:', 16:21:12 INFO - 'HOMEPATH': '\\Users\\cltbld.T-W864-IX-155', 16:21:12 INFO - 'KTS_HOME': 'C:\\Program Files\\KTS', 16:21:12 INFO - 'KTS_VERSION': '1.19c', 16:21:12 INFO - 'LOCALAPPDATA': 'C:\\Users\\cltbld.T-W864-IX-155\\AppData\\Local', 16:21:12 INFO - 'LOGONSERVER': '\\\\T-W864-IX-155', 16:21:12 INFO - 'MONDIR': 'C:\\Monitor_config\\', 16:21:12 INFO - 'MOZBUILDDIR': 'C:\\mozilla-build\\', 16:21:12 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:21:12 INFO - 'MOZ_NO_REMOTE': '1', 16:21:12 INFO - 'NO_EM_RESTART': '1', 16:21:12 INFO - 'NUMBER_OF_PROCESSORS': '8', 16:21:12 INFO - 'OS': 'Windows_NT', 16:21:12 INFO - 'OURDRIVE': 'C:', 16:21:12 INFO - 'PATH': 'C:\\Program Files (x86)\\NVIDIA Corporation\\PhysX\\Common;C:\\windows\\system32;C:\\windows;C:\\windows\\System32\\Wbem;C:\\windows\\System32\\WindowsPowerShell\\v1.0\\;C:\\mozilla-build\\python27;C:\\mozilla-build\\python27\\Scripts;C:\\mozilla-build\\msys\\bin;C:\\mozilla-build\\vim\\vim72;C:\\mozilla-build\\wget;C:\\mozilla-build\\info-zip;C:\\CoreUtils\\bin;C:\\mozilla-build\\buildbotve\\scripts;C:\\mozilla-build\\hg', 16:21:12 INFO - 'PATHEXT': '.COM;.EXE;.BAT;.CMD;.VBS;.VBE;.JS;.JSE;.WSF;.WSH;.MSC', 16:21:12 INFO - 'PROCESSOR_ARCHITECTURE': 'x86', 16:21:12 INFO - 'PROCESSOR_ARCHITEW6432': 'AMD64', 16:21:12 INFO - 'PROCESSOR_IDENTIFIER': 'Intel64 Family 6 Model 30 Stepping 5, GenuineIntel', 16:21:12 INFO - 'PROCESSOR_LEVEL': '6', 16:21:12 INFO - 'PROCESSOR_REVISION': '1e05', 16:21:12 INFO - 'PROGRAMDATA': 'C:\\ProgramData', 16:21:12 INFO - 'PROGRAMFILES': 'C:\\Program Files (x86)', 16:21:12 INFO - 'PROGRAMFILES(X86)': 'C:\\Program Files (x86)', 16:21:12 INFO - 'PROGRAMW6432': 'C:\\Program Files', 16:21:12 INFO - 'PROMPT': '$P$G', 16:21:12 INFO - 'PROPERTIES_FILE': 'C:\\slave\\test/buildprops.json', 16:21:12 INFO - 'PSMODULEPATH': 'C:\\windows\\system32\\WindowsPowerShell\\v1.0\\Modules\\', 16:21:12 INFO - 'PUBLIC': 'C:\\Users\\Public', 16:21:12 INFO - 'PWD': 'C:\\slave\\test', 16:21:12 INFO - 'RUNLOGFILE': 'C:\\slave\\\\runslave.log', 16:21:12 INFO - 'SLAVEDIR': 'C:\\slave\\', 16:21:12 INFO - 'SYSTEMDRIVE': 'C:', 16:21:12 INFO - 'SYSTEMROOT': 'C:\\windows', 16:21:12 INFO - 'TEMP': 'C:\\Users\\CLTBLD~1.T-W\\AppData\\Local\\Temp', 16:21:12 INFO - 'TEST1': 'testie', 16:21:12 INFO - 'TMP': 'C:\\Users\\CLTBLD~1.T-W\\AppData\\Local\\Temp', 16:21:12 INFO - 'USERDOMAIN': 'T-W864-IX-155', 16:21:12 INFO - 'USERDOMAIN_ROAMINGPROFILE': 'T-W864-IX-155', 16:21:12 INFO - 'USERNAME': 'cltbld', 16:21:12 INFO - 'USERPROFILE': 'C:\\Users\\cltbld.T-W864-IX-155', 16:21:12 INFO - 'WINDIR': 'C:\\windows', 16:21:12 INFO - 'XPCOM_DEBUG_BREAK': 'warn'} 16:21:14 INFO - Ignoring indexes: https://pypi.python.org/simple/ 16:21:14 INFO - Downloading/unpacking psutil>=0.7.1 16:21:14 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 16:21:14 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 16:21:17 INFO - Storing download in cache at c:\slave\test\build\venv\cache\http%3a%2f%2fpypi.pvt.build.mozilla.org%2fpub%2fpsutil-3.1.1-cp27-none-win32.whl 16:21:17 INFO - Installing collected packages: psutil 16:21:17 INFO - Successfully installed psutil 16:21:17 INFO - Cleaning up... 16:21:17 INFO - Return code: 0 16:21:17 INFO - Installing mozsystemmonitor==0.0.0 into virtualenv C:\slave\test\build/venv 16:21:17 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 16:21:17 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 16:21:17 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 16:21:17 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 16:21:17 INFO - retry: Calling run_command with args: [['C:\\slave\\test\\build\\venv\\Scripts\\pip', 'install', '--download-cache', 'C:\\slave\\test\\build/venv\\cache', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.0.0']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x023AFB10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x02371EA8>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x02449A90>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x01D98B48>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x01DBA700>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x0242A660>, 'level': 'critical'}], 'cwd': 'C:\\slave\\test\\build', 'env': {'TMP': 'C:\\Users\\CLTBLD~1.T-W\\AppData\\Local\\Temp', 'TEST1': 'testie', 'COMPUTERNAME': 'T-W864-IX-155', 'USERDOMAIN': 'T-W864-IX-155', 'KTS_VERSION': '1.19c', 'PSMODULEPATH': 'C:\\windows\\system32\\WindowsPowerShell\\v1.0\\Modules\\', 'COMMONPROGRAMFILES': 'C:\\Program Files (x86)\\Common Files', 'PROCESSOR_IDENTIFIER': 'Intel64 Family 6 Model 30 Stepping 5, GenuineIntel', 'PROGRAMFILES': 'C:\\Program Files (x86)', 'PROCESSOR_REVISION': '1e05', 'DNSSUFFIX': 'wintest.releng.scl3.mozilla.com', 'SYSTEMROOT': 'C:\\windows', 'NO_EM_RESTART': '1', 'PROGRAMFILES(X86)': 'C:\\Program Files (x86)', 'OURDRIVE': 'C:', 'XPCOM_DEBUG_BREAK': 'warn', 'MONDIR': 'C:\\Monitor_config\\', 'TEMP': 'C:\\Users\\CLTBLD~1.T-W\\AppData\\Local\\Temp', 'COMMONPROGRAMFILES(X86)': 'C:\\Program Files (x86)\\Common Files', 'RUNLOGFILE': 'C:\\slave\\\\runslave.log', 'PROCESSOR_ARCHITECTURE': 'x86', 'ALLUSERSPROFILE': 'C:\\ProgramData', 'USERPROFILE': 'C:\\Users\\cltbld.T-W864-IX-155', 'LOCALAPPDATA': 'C:\\Users\\cltbld.T-W864-IX-155\\AppData\\Local', 'HOMEPATH': '\\Users\\cltbld.T-W864-IX-155', 'USERDOMAIN_ROAMINGPROFILE': 'T-W864-IX-155', 'MOZBUILDDIR': 'C:\\mozilla-build\\', 'PROGRAMW6432': 'C:\\Program Files', 'USERNAME': 'cltbld', 'LOGONSERVER': '\\\\T-W864-IX-155', 'MOZ_NO_REMOTE': '1', 'COMSPEC': 'C:\\windows\\system32\\cmd.exe', 'PROGRAMDATA': 'C:\\ProgramData', 'PROPERTIES_FILE': 'C:\\slave\\test/buildprops.json', 'PATH': 'C:\\Program Files (x86)\\NVIDIA Corporation\\PhysX\\Common;C:\\windows\\system32;C:\\windows;C:\\windows\\System32\\Wbem;C:\\windows\\System32\\WindowsPowerShell\\v1.0\\;C:\\mozilla-build\\python27;C:\\mozilla-build\\python27\\Scripts;C:\\mozilla-build\\msys\\bin;C:\\mozilla-build\\vim\\vim72;C:\\mozilla-build\\wget;C:\\mozilla-build\\info-zip;C:\\CoreUtils\\bin;C:\\mozilla-build\\buildbotve\\scripts;C:\\mozilla-build\\hg', 'PROMPT': '$P$G', 'PATHEXT': '.COM;.EXE;.BAT;.CMD;.VBS;.VBE;.JS;.JSE;.WSF;.WSH;.MSC', 'FP_NO_HOST_CHECK': 'NO', 'DCLOCATION': 'SCL3', 'APPDATA': 'C:\\Users\\cltbld.T-W864-IX-155\\AppData\\Roaming', 'HOMEDRIVE': 'C:', 'SYSTEMDRIVE': 'C:', 'SLAVEDIR': 'C:\\slave\\', 'NUMBER_OF_PROCESSORS': '8', 'PWD': 'C:\\slave\\test', 'PROCESSOR_LEVEL': '6', 'KTS_HOME': 'C:\\Program Files\\KTS', 'PROCESSOR_ARCHITEW6432': 'AMD64', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'COMMONPROGRAMW6432': 'C:\\Program Files\\Common Files', 'OS': 'Windows_NT', 'PUBLIC': 'C:\\Users\\Public', 'WINDIR': 'C:\\windows'}}, attempt #1 16:21:17 INFO - Running command: ['C:\\slave\\test\\build\\venv\\Scripts\\pip', 'install', '--download-cache', 'C:\\slave\\test\\build/venv\\cache', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.0.0'] in C:\slave\test\build 16:21:17 INFO - Copy/paste: C:\slave\test\build\venv\Scripts\pip install --download-cache C:\slave\test\build/venv\cache --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub mozsystemmonitor==0.0.0 16:21:17 INFO - Using env: {'ALLUSERSPROFILE': 'C:\\ProgramData', 16:21:17 INFO - 'APPDATA': 'C:\\Users\\cltbld.T-W864-IX-155\\AppData\\Roaming', 16:21:17 INFO - 'COMMONPROGRAMFILES': 'C:\\Program Files (x86)\\Common Files', 16:21:17 INFO - 'COMMONPROGRAMFILES(X86)': 'C:\\Program Files (x86)\\Common Files', 16:21:17 INFO - 'COMMONPROGRAMW6432': 'C:\\Program Files\\Common Files', 16:21:17 INFO - 'COMPUTERNAME': 'T-W864-IX-155', 16:21:17 INFO - 'COMSPEC': 'C:\\windows\\system32\\cmd.exe', 16:21:17 INFO - 'DCLOCATION': 'SCL3', 16:21:17 INFO - 'DNSSUFFIX': 'wintest.releng.scl3.mozilla.com', 16:21:17 INFO - 'FP_NO_HOST_CHECK': 'NO', 16:21:17 INFO - 'HOMEDRIVE': 'C:', 16:21:17 INFO - 'HOMEPATH': '\\Users\\cltbld.T-W864-IX-155', 16:21:17 INFO - 'KTS_HOME': 'C:\\Program Files\\KTS', 16:21:17 INFO - 'KTS_VERSION': '1.19c', 16:21:17 INFO - 'LOCALAPPDATA': 'C:\\Users\\cltbld.T-W864-IX-155\\AppData\\Local', 16:21:17 INFO - 'LOGONSERVER': '\\\\T-W864-IX-155', 16:21:17 INFO - 'MONDIR': 'C:\\Monitor_config\\', 16:21:17 INFO - 'MOZBUILDDIR': 'C:\\mozilla-build\\', 16:21:17 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:21:17 INFO - 'MOZ_NO_REMOTE': '1', 16:21:17 INFO - 'NO_EM_RESTART': '1', 16:21:17 INFO - 'NUMBER_OF_PROCESSORS': '8', 16:21:17 INFO - 'OS': 'Windows_NT', 16:21:17 INFO - 'OURDRIVE': 'C:', 16:21:17 INFO - 'PATH': 'C:\\Program Files (x86)\\NVIDIA Corporation\\PhysX\\Common;C:\\windows\\system32;C:\\windows;C:\\windows\\System32\\Wbem;C:\\windows\\System32\\WindowsPowerShell\\v1.0\\;C:\\mozilla-build\\python27;C:\\mozilla-build\\python27\\Scripts;C:\\mozilla-build\\msys\\bin;C:\\mozilla-build\\vim\\vim72;C:\\mozilla-build\\wget;C:\\mozilla-build\\info-zip;C:\\CoreUtils\\bin;C:\\mozilla-build\\buildbotve\\scripts;C:\\mozilla-build\\hg', 16:21:17 INFO - 'PATHEXT': '.COM;.EXE;.BAT;.CMD;.VBS;.VBE;.JS;.JSE;.WSF;.WSH;.MSC', 16:21:17 INFO - 'PROCESSOR_ARCHITECTURE': 'x86', 16:21:17 INFO - 'PROCESSOR_ARCHITEW6432': 'AMD64', 16:21:17 INFO - 'PROCESSOR_IDENTIFIER': 'Intel64 Family 6 Model 30 Stepping 5, GenuineIntel', 16:21:17 INFO - 'PROCESSOR_LEVEL': '6', 16:21:17 INFO - 'PROCESSOR_REVISION': '1e05', 16:21:17 INFO - 'PROGRAMDATA': 'C:\\ProgramData', 16:21:17 INFO - 'PROGRAMFILES': 'C:\\Program Files (x86)', 16:21:17 INFO - 'PROGRAMFILES(X86)': 'C:\\Program Files (x86)', 16:21:17 INFO - 'PROGRAMW6432': 'C:\\Program Files', 16:21:17 INFO - 'PROMPT': '$P$G', 16:21:17 INFO - 'PROPERTIES_FILE': 'C:\\slave\\test/buildprops.json', 16:21:17 INFO - 'PSMODULEPATH': 'C:\\windows\\system32\\WindowsPowerShell\\v1.0\\Modules\\', 16:21:17 INFO - 'PUBLIC': 'C:\\Users\\Public', 16:21:17 INFO - 'PWD': 'C:\\slave\\test', 16:21:17 INFO - 'RUNLOGFILE': 'C:\\slave\\\\runslave.log', 16:21:17 INFO - 'SLAVEDIR': 'C:\\slave\\', 16:21:17 INFO - 'SYSTEMDRIVE': 'C:', 16:21:17 INFO - 'SYSTEMROOT': 'C:\\windows', 16:21:17 INFO - 'TEMP': 'C:\\Users\\CLTBLD~1.T-W\\AppData\\Local\\Temp', 16:21:17 INFO - 'TEST1': 'testie', 16:21:17 INFO - 'TMP': 'C:\\Users\\CLTBLD~1.T-W\\AppData\\Local\\Temp', 16:21:17 INFO - 'USERDOMAIN': 'T-W864-IX-155', 16:21:17 INFO - 'USERDOMAIN_ROAMINGPROFILE': 'T-W864-IX-155', 16:21:17 INFO - 'USERNAME': 'cltbld', 16:21:17 INFO - 'USERPROFILE': 'C:\\Users\\cltbld.T-W864-IX-155', 16:21:17 INFO - 'WINDIR': 'C:\\windows', 16:21:17 INFO - 'XPCOM_DEBUG_BREAK': 'warn'} 16:21:17 INFO - Ignoring indexes: https://pypi.python.org/simple/ 16:21:17 INFO - Downloading/unpacking mozsystemmonitor==0.0.0 16:21:17 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 16:21:17 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 16:21:22 INFO - Downloading mozsystemmonitor-0.0.tar.gz 16:21:22 INFO - Storing download in cache at c:\slave\test\build\venv\cache\http%3a%2f%2fpypi.pvt.build.mozilla.org%2fpub%2fmozsystemmonitor-0.0.tar.gz 16:21:22 INFO - Running setup.py (path:C:\slave\test\build\venv\build\mozsystemmonitor\setup.py) egg_info for package mozsystemmonitor 16:21:22 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=0.7.1 in c:\slave\test\build\venv\lib\site-packages (from mozsystemmonitor==0.0.0) 16:21:22 INFO - Installing collected packages: mozsystemmonitor 16:21:22 INFO - Running setup.py install for mozsystemmonitor 16:21:22 INFO - Successfully installed mozsystemmonitor 16:21:22 INFO - Cleaning up... 16:21:22 INFO - Return code: 0 16:21:22 INFO - Installing blobuploader==1.2.4 into virtualenv C:\slave\test\build/venv 16:21:22 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 16:21:22 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 16:21:22 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 16:21:22 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 16:21:22 INFO - retry: Calling run_command with args: [['C:\\slave\\test\\build\\venv\\Scripts\\pip', 'install', '--download-cache', 'C:\\slave\\test\\build/venv\\cache', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'blobuploader==1.2.4']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x023AFB10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x02371EA8>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x02449A90>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x01D98B48>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x01DBA700>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x0242A660>, 'level': 'critical'}], 'cwd': 'C:\\slave\\test\\build', 'env': {'TMP': 'C:\\Users\\CLTBLD~1.T-W\\AppData\\Local\\Temp', 'TEST1': 'testie', 'COMPUTERNAME': 'T-W864-IX-155', 'USERDOMAIN': 'T-W864-IX-155', 'KTS_VERSION': '1.19c', 'PSMODULEPATH': 'C:\\windows\\system32\\WindowsPowerShell\\v1.0\\Modules\\', 'COMMONPROGRAMFILES': 'C:\\Program Files (x86)\\Common Files', 'PROCESSOR_IDENTIFIER': 'Intel64 Family 6 Model 30 Stepping 5, GenuineIntel', 'PROGRAMFILES': 'C:\\Program Files (x86)', 'PROCESSOR_REVISION': '1e05', 'DNSSUFFIX': 'wintest.releng.scl3.mozilla.com', 'SYSTEMROOT': 'C:\\windows', 'NO_EM_RESTART': '1', 'PROGRAMFILES(X86)': 'C:\\Program Files (x86)', 'OURDRIVE': 'C:', 'XPCOM_DEBUG_BREAK': 'warn', 'MONDIR': 'C:\\Monitor_config\\', 'TEMP': 'C:\\Users\\CLTBLD~1.T-W\\AppData\\Local\\Temp', 'COMMONPROGRAMFILES(X86)': 'C:\\Program Files (x86)\\Common Files', 'RUNLOGFILE': 'C:\\slave\\\\runslave.log', 'PROCESSOR_ARCHITECTURE': 'x86', 'ALLUSERSPROFILE': 'C:\\ProgramData', 'USERPROFILE': 'C:\\Users\\cltbld.T-W864-IX-155', 'LOCALAPPDATA': 'C:\\Users\\cltbld.T-W864-IX-155\\AppData\\Local', 'HOMEPATH': '\\Users\\cltbld.T-W864-IX-155', 'USERDOMAIN_ROAMINGPROFILE': 'T-W864-IX-155', 'MOZBUILDDIR': 'C:\\mozilla-build\\', 'PROGRAMW6432': 'C:\\Program Files', 'USERNAME': 'cltbld', 'LOGONSERVER': '\\\\T-W864-IX-155', 'MOZ_NO_REMOTE': '1', 'COMSPEC': 'C:\\windows\\system32\\cmd.exe', 'PROGRAMDATA': 'C:\\ProgramData', 'PROPERTIES_FILE': 'C:\\slave\\test/buildprops.json', 'PATH': 'C:\\Program Files (x86)\\NVIDIA Corporation\\PhysX\\Common;C:\\windows\\system32;C:\\windows;C:\\windows\\System32\\Wbem;C:\\windows\\System32\\WindowsPowerShell\\v1.0\\;C:\\mozilla-build\\python27;C:\\mozilla-build\\python27\\Scripts;C:\\mozilla-build\\msys\\bin;C:\\mozilla-build\\vim\\vim72;C:\\mozilla-build\\wget;C:\\mozilla-build\\info-zip;C:\\CoreUtils\\bin;C:\\mozilla-build\\buildbotve\\scripts;C:\\mozilla-build\\hg', 'PROMPT': '$P$G', 'PATHEXT': '.COM;.EXE;.BAT;.CMD;.VBS;.VBE;.JS;.JSE;.WSF;.WSH;.MSC', 'FP_NO_HOST_CHECK': 'NO', 'DCLOCATION': 'SCL3', 'APPDATA': 'C:\\Users\\cltbld.T-W864-IX-155\\AppData\\Roaming', 'HOMEDRIVE': 'C:', 'SYSTEMDRIVE': 'C:', 'SLAVEDIR': 'C:\\slave\\', 'NUMBER_OF_PROCESSORS': '8', 'PWD': 'C:\\slave\\test', 'PROCESSOR_LEVEL': '6', 'KTS_HOME': 'C:\\Program Files\\KTS', 'PROCESSOR_ARCHITEW6432': 'AMD64', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'COMMONPROGRAMW6432': 'C:\\Program Files\\Common Files', 'OS': 'Windows_NT', 'PUBLIC': 'C:\\Users\\Public', 'WINDIR': 'C:\\windows'}}, attempt #1 16:21:22 INFO - Running command: ['C:\\slave\\test\\build\\venv\\Scripts\\pip', 'install', '--download-cache', 'C:\\slave\\test\\build/venv\\cache', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'blobuploader==1.2.4'] in C:\slave\test\build 16:21:22 INFO - Copy/paste: C:\slave\test\build\venv\Scripts\pip install --download-cache C:\slave\test\build/venv\cache --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub blobuploader==1.2.4 16:21:22 INFO - Using env: {'ALLUSERSPROFILE': 'C:\\ProgramData', 16:21:22 INFO - 'APPDATA': 'C:\\Users\\cltbld.T-W864-IX-155\\AppData\\Roaming', 16:21:22 INFO - 'COMMONPROGRAMFILES': 'C:\\Program Files (x86)\\Common Files', 16:21:22 INFO - 'COMMONPROGRAMFILES(X86)': 'C:\\Program Files (x86)\\Common Files', 16:21:22 INFO - 'COMMONPROGRAMW6432': 'C:\\Program Files\\Common Files', 16:21:22 INFO - 'COMPUTERNAME': 'T-W864-IX-155', 16:21:22 INFO - 'COMSPEC': 'C:\\windows\\system32\\cmd.exe', 16:21:22 INFO - 'DCLOCATION': 'SCL3', 16:21:22 INFO - 'DNSSUFFIX': 'wintest.releng.scl3.mozilla.com', 16:21:22 INFO - 'FP_NO_HOST_CHECK': 'NO', 16:21:22 INFO - 'HOMEDRIVE': 'C:', 16:21:22 INFO - 'HOMEPATH': '\\Users\\cltbld.T-W864-IX-155', 16:21:22 INFO - 'KTS_HOME': 'C:\\Program Files\\KTS', 16:21:22 INFO - 'KTS_VERSION': '1.19c', 16:21:22 INFO - 'LOCALAPPDATA': 'C:\\Users\\cltbld.T-W864-IX-155\\AppData\\Local', 16:21:22 INFO - 'LOGONSERVER': '\\\\T-W864-IX-155', 16:21:22 INFO - 'MONDIR': 'C:\\Monitor_config\\', 16:21:22 INFO - 'MOZBUILDDIR': 'C:\\mozilla-build\\', 16:21:22 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:21:22 INFO - 'MOZ_NO_REMOTE': '1', 16:21:22 INFO - 'NO_EM_RESTART': '1', 16:21:22 INFO - 'NUMBER_OF_PROCESSORS': '8', 16:21:22 INFO - 'OS': 'Windows_NT', 16:21:22 INFO - 'OURDRIVE': 'C:', 16:21:22 INFO - 'PATH': 'C:\\Program Files (x86)\\NVIDIA Corporation\\PhysX\\Common;C:\\windows\\system32;C:\\windows;C:\\windows\\System32\\Wbem;C:\\windows\\System32\\WindowsPowerShell\\v1.0\\;C:\\mozilla-build\\python27;C:\\mozilla-build\\python27\\Scripts;C:\\mozilla-build\\msys\\bin;C:\\mozilla-build\\vim\\vim72;C:\\mozilla-build\\wget;C:\\mozilla-build\\info-zip;C:\\CoreUtils\\bin;C:\\mozilla-build\\buildbotve\\scripts;C:\\mozilla-build\\hg', 16:21:22 INFO - 'PATHEXT': '.COM;.EXE;.BAT;.CMD;.VBS;.VBE;.JS;.JSE;.WSF;.WSH;.MSC', 16:21:22 INFO - 'PROCESSOR_ARCHITECTURE': 'x86', 16:21:22 INFO - 'PROCESSOR_ARCHITEW6432': 'AMD64', 16:21:22 INFO - 'PROCESSOR_IDENTIFIER': 'Intel64 Family 6 Model 30 Stepping 5, GenuineIntel', 16:21:22 INFO - 'PROCESSOR_LEVEL': '6', 16:21:22 INFO - 'PROCESSOR_REVISION': '1e05', 16:21:22 INFO - 'PROGRAMDATA': 'C:\\ProgramData', 16:21:22 INFO - 'PROGRAMFILES': 'C:\\Program Files (x86)', 16:21:22 INFO - 'PROGRAMFILES(X86)': 'C:\\Program Files (x86)', 16:21:22 INFO - 'PROGRAMW6432': 'C:\\Program Files', 16:21:22 INFO - 'PROMPT': '$P$G', 16:21:22 INFO - 'PROPERTIES_FILE': 'C:\\slave\\test/buildprops.json', 16:21:22 INFO - 'PSMODULEPATH': 'C:\\windows\\system32\\WindowsPowerShell\\v1.0\\Modules\\', 16:21:22 INFO - 'PUBLIC': 'C:\\Users\\Public', 16:21:22 INFO - 'PWD': 'C:\\slave\\test', 16:21:22 INFO - 'RUNLOGFILE': 'C:\\slave\\\\runslave.log', 16:21:22 INFO - 'SLAVEDIR': 'C:\\slave\\', 16:21:22 INFO - 'SYSTEMDRIVE': 'C:', 16:21:22 INFO - 'SYSTEMROOT': 'C:\\windows', 16:21:22 INFO - 'TEMP': 'C:\\Users\\CLTBLD~1.T-W\\AppData\\Local\\Temp', 16:21:22 INFO - 'TEST1': 'testie', 16:21:22 INFO - 'TMP': 'C:\\Users\\CLTBLD~1.T-W\\AppData\\Local\\Temp', 16:21:22 INFO - 'USERDOMAIN': 'T-W864-IX-155', 16:21:22 INFO - 'USERDOMAIN_ROAMINGPROFILE': 'T-W864-IX-155', 16:21:22 INFO - 'USERNAME': 'cltbld', 16:21:22 INFO - 'USERPROFILE': 'C:\\Users\\cltbld.T-W864-IX-155', 16:21:22 INFO - 'WINDIR': 'C:\\windows', 16:21:22 INFO - 'XPCOM_DEBUG_BREAK': 'warn'} 16:21:23 INFO - Ignoring indexes: https://pypi.python.org/simple/ 16:21:23 INFO - Downloading/unpacking blobuploader==1.2.4 16:21:23 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 16:21:23 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 16:21:26 INFO - Downloading blobuploader-1.2.4.tar.gz 16:21:26 INFO - Storing download in cache at c:\slave\test\build\venv\cache\http%3a%2f%2fpypi.pvt.build.mozilla.org%2fpub%2fblobuploader-1.2.4.tar.gz 16:21:26 INFO - Running setup.py (path:C:\slave\test\build\venv\build\blobuploader\setup.py) egg_info for package blobuploader 16:21:26 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 16:21:26 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 16:21:26 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 16:21:28 INFO - Storing download in cache at c:\slave\test\build\venv\cache\http%3a%2f%2fpypi.pvt.build.mozilla.org%2fpub%2frequests-1.2.3.tar.gz 16:21:28 INFO - Running setup.py (path:C:\slave\test\build\venv\build\requests\setup.py) egg_info for package requests 16:21:29 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 16:21:29 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 16:21:29 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 16:21:29 INFO - Downloading docopt-0.6.1.tar.gz 16:21:29 INFO - Storing download in cache at c:\slave\test\build\venv\cache\http%3a%2f%2fpypi.pvt.build.mozilla.org%2fpub%2fdocopt-0.6.1.tar.gz 16:21:29 INFO - Running setup.py (path:C:\slave\test\build\venv\build\docopt\setup.py) egg_info for package docopt 16:21:29 INFO - Installing collected packages: blobuploader, requests, docopt 16:21:29 INFO - Running setup.py install for blobuploader 16:21:29 INFO - Running setup.py install for requests 16:21:30 INFO - Running setup.py install for docopt 16:21:30 INFO - Successfully installed blobuploader requests docopt 16:21:30 INFO - Cleaning up... 16:21:31 INFO - Return code: 0 16:21:31 INFO - Installing None into virtualenv C:\slave\test\build/venv 16:21:31 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 16:21:31 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 16:21:31 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 16:21:31 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 16:21:31 INFO - retry: Calling run_command with args: [['C:\\slave\\test\\build\\venv\\Scripts\\pip', 'install', '--no-deps', '--download-cache', 'C:\\slave\\test\\build/venv\\cache', '--timeout', '120', '-r', 'C:\\slave\\test\\build\\tests\\config\\mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x023AFB10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x02371EA8>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x02449A90>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x01D98B48>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x01DBA700>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x0242A660>, 'level': 'critical'}], 'cwd': 'C:\\slave\\test\\build\\tests\\config', 'env': {'TMP': 'C:\\Users\\CLTBLD~1.T-W\\AppData\\Local\\Temp', 'TEST1': 'testie', 'COMPUTERNAME': 'T-W864-IX-155', 'USERDOMAIN': 'T-W864-IX-155', 'KTS_VERSION': '1.19c', 'PSMODULEPATH': 'C:\\windows\\system32\\WindowsPowerShell\\v1.0\\Modules\\', 'COMMONPROGRAMFILES': 'C:\\Program Files (x86)\\Common Files', 'PROCESSOR_IDENTIFIER': 'Intel64 Family 6 Model 30 Stepping 5, GenuineIntel', 'PROGRAMFILES': 'C:\\Program Files (x86)', 'PROCESSOR_REVISION': '1e05', 'DNSSUFFIX': 'wintest.releng.scl3.mozilla.com', 'SYSTEMROOT': 'C:\\windows', 'NO_EM_RESTART': '1', 'PROGRAMFILES(X86)': 'C:\\Program Files (x86)', 'OURDRIVE': 'C:', 'XPCOM_DEBUG_BREAK': 'warn', 'MONDIR': 'C:\\Monitor_config\\', 'TEMP': 'C:\\Users\\CLTBLD~1.T-W\\AppData\\Local\\Temp', 'COMMONPROGRAMFILES(X86)': 'C:\\Program Files (x86)\\Common Files', 'RUNLOGFILE': 'C:\\slave\\\\runslave.log', 'PROCESSOR_ARCHITECTURE': 'x86', 'ALLUSERSPROFILE': 'C:\\ProgramData', 'USERPROFILE': 'C:\\Users\\cltbld.T-W864-IX-155', 'LOCALAPPDATA': 'C:\\Users\\cltbld.T-W864-IX-155\\AppData\\Local', 'HOMEPATH': '\\Users\\cltbld.T-W864-IX-155', 'USERDOMAIN_ROAMINGPROFILE': 'T-W864-IX-155', 'MOZBUILDDIR': 'C:\\mozilla-build\\', 'PROGRAMW6432': 'C:\\Program Files', 'USERNAME': 'cltbld', 'LOGONSERVER': '\\\\T-W864-IX-155', 'MOZ_NO_REMOTE': '1', 'COMSPEC': 'C:\\windows\\system32\\cmd.exe', 'PROGRAMDATA': 'C:\\ProgramData', 'PROPERTIES_FILE': 'C:\\slave\\test/buildprops.json', 'PATH': 'C:\\Program Files (x86)\\NVIDIA Corporation\\PhysX\\Common;C:\\windows\\system32;C:\\windows;C:\\windows\\System32\\Wbem;C:\\windows\\System32\\WindowsPowerShell\\v1.0\\;C:\\mozilla-build\\python27;C:\\mozilla-build\\python27\\Scripts;C:\\mozilla-build\\msys\\bin;C:\\mozilla-build\\vim\\vim72;C:\\mozilla-build\\wget;C:\\mozilla-build\\info-zip;C:\\CoreUtils\\bin;C:\\mozilla-build\\buildbotve\\scripts;C:\\mozilla-build\\hg', 'PROMPT': '$P$G', 'PATHEXT': '.COM;.EXE;.BAT;.CMD;.VBS;.VBE;.JS;.JSE;.WSF;.WSH;.MSC', 'FP_NO_HOST_CHECK': 'NO', 'DCLOCATION': 'SCL3', 'APPDATA': 'C:\\Users\\cltbld.T-W864-IX-155\\AppData\\Roaming', 'HOMEDRIVE': 'C:', 'SYSTEMDRIVE': 'C:', 'SLAVEDIR': 'C:\\slave\\', 'NUMBER_OF_PROCESSORS': '8', 'PWD': 'C:\\slave\\test', 'PROCESSOR_LEVEL': '6', 'KTS_HOME': 'C:\\Program Files\\KTS', 'PROCESSOR_ARCHITEW6432': 'AMD64', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'COMMONPROGRAMW6432': 'C:\\Program Files\\Common Files', 'OS': 'Windows_NT', 'PUBLIC': 'C:\\Users\\Public', 'WINDIR': 'C:\\windows'}}, attempt #1 16:21:31 INFO - Running command: ['C:\\slave\\test\\build\\venv\\Scripts\\pip', 'install', '--no-deps', '--download-cache', 'C:\\slave\\test\\build/venv\\cache', '--timeout', '120', '-r', 'C:\\slave\\test\\build\\tests\\config\\mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in C:\slave\test\build\tests\config 16:21:31 INFO - Copy/paste: C:\slave\test\build\venv\Scripts\pip install --no-deps --download-cache C:\slave\test\build/venv\cache --timeout 120 -r C:\slave\test\build\tests\config\mozbase_requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 16:21:31 INFO - Using env: {'ALLUSERSPROFILE': 'C:\\ProgramData', 16:21:31 INFO - 'APPDATA': 'C:\\Users\\cltbld.T-W864-IX-155\\AppData\\Roaming', 16:21:31 INFO - 'COMMONPROGRAMFILES': 'C:\\Program Files (x86)\\Common Files', 16:21:31 INFO - 'COMMONPROGRAMFILES(X86)': 'C:\\Program Files (x86)\\Common Files', 16:21:31 INFO - 'COMMONPROGRAMW6432': 'C:\\Program Files\\Common Files', 16:21:31 INFO - 'COMPUTERNAME': 'T-W864-IX-155', 16:21:31 INFO - 'COMSPEC': 'C:\\windows\\system32\\cmd.exe', 16:21:31 INFO - 'DCLOCATION': 'SCL3', 16:21:31 INFO - 'DNSSUFFIX': 'wintest.releng.scl3.mozilla.com', 16:21:31 INFO - 'FP_NO_HOST_CHECK': 'NO', 16:21:31 INFO - 'HOMEDRIVE': 'C:', 16:21:31 INFO - 'HOMEPATH': '\\Users\\cltbld.T-W864-IX-155', 16:21:31 INFO - 'KTS_HOME': 'C:\\Program Files\\KTS', 16:21:31 INFO - 'KTS_VERSION': '1.19c', 16:21:31 INFO - 'LOCALAPPDATA': 'C:\\Users\\cltbld.T-W864-IX-155\\AppData\\Local', 16:21:31 INFO - 'LOGONSERVER': '\\\\T-W864-IX-155', 16:21:31 INFO - 'MONDIR': 'C:\\Monitor_config\\', 16:21:31 INFO - 'MOZBUILDDIR': 'C:\\mozilla-build\\', 16:21:31 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:21:31 INFO - 'MOZ_NO_REMOTE': '1', 16:21:31 INFO - 'NO_EM_RESTART': '1', 16:21:31 INFO - 'NUMBER_OF_PROCESSORS': '8', 16:21:31 INFO - 'OS': 'Windows_NT', 16:21:31 INFO - 'OURDRIVE': 'C:', 16:21:31 INFO - 'PATH': 'C:\\Program Files (x86)\\NVIDIA Corporation\\PhysX\\Common;C:\\windows\\system32;C:\\windows;C:\\windows\\System32\\Wbem;C:\\windows\\System32\\WindowsPowerShell\\v1.0\\;C:\\mozilla-build\\python27;C:\\mozilla-build\\python27\\Scripts;C:\\mozilla-build\\msys\\bin;C:\\mozilla-build\\vim\\vim72;C:\\mozilla-build\\wget;C:\\mozilla-build\\info-zip;C:\\CoreUtils\\bin;C:\\mozilla-build\\buildbotve\\scripts;C:\\mozilla-build\\hg', 16:21:31 INFO - 'PATHEXT': '.COM;.EXE;.BAT;.CMD;.VBS;.VBE;.JS;.JSE;.WSF;.WSH;.MSC', 16:21:31 INFO - 'PROCESSOR_ARCHITECTURE': 'x86', 16:21:31 INFO - 'PROCESSOR_ARCHITEW6432': 'AMD64', 16:21:31 INFO - 'PROCESSOR_IDENTIFIER': 'Intel64 Family 6 Model 30 Stepping 5, GenuineIntel', 16:21:31 INFO - 'PROCESSOR_LEVEL': '6', 16:21:31 INFO - 'PROCESSOR_REVISION': '1e05', 16:21:31 INFO - 'PROGRAMDATA': 'C:\\ProgramData', 16:21:31 INFO - 'PROGRAMFILES': 'C:\\Program Files (x86)', 16:21:31 INFO - 'PROGRAMFILES(X86)': 'C:\\Program Files (x86)', 16:21:31 INFO - 'PROGRAMW6432': 'C:\\Program Files', 16:21:31 INFO - 'PROMPT': '$P$G', 16:21:31 INFO - 'PROPERTIES_FILE': 'C:\\slave\\test/buildprops.json', 16:21:31 INFO - 'PSMODULEPATH': 'C:\\windows\\system32\\WindowsPowerShell\\v1.0\\Modules\\', 16:21:31 INFO - 'PUBLIC': 'C:\\Users\\Public', 16:21:31 INFO - 'PWD': 'C:\\slave\\test', 16:21:31 INFO - 'RUNLOGFILE': 'C:\\slave\\\\runslave.log', 16:21:31 INFO - 'SLAVEDIR': 'C:\\slave\\', 16:21:31 INFO - 'SYSTEMDRIVE': 'C:', 16:21:31 INFO - 'SYSTEMROOT': 'C:\\windows', 16:21:31 INFO - 'TEMP': 'C:\\Users\\CLTBLD~1.T-W\\AppData\\Local\\Temp', 16:21:31 INFO - 'TEST1': 'testie', 16:21:31 INFO - 'TMP': 'C:\\Users\\CLTBLD~1.T-W\\AppData\\Local\\Temp', 16:21:31 INFO - 'USERDOMAIN': 'T-W864-IX-155', 16:21:31 INFO - 'USERDOMAIN_ROAMINGPROFILE': 'T-W864-IX-155', 16:21:31 INFO - 'USERNAME': 'cltbld', 16:21:31 INFO - 'USERPROFILE': 'C:\\Users\\cltbld.T-W864-IX-155', 16:21:31 INFO - 'WINDIR': 'C:\\windows', 16:21:31 INFO - 'XPCOM_DEBUG_BREAK': 'warn'} 16:21:32 INFO - Ignoring indexes: https://pypi.python.org/simple/ 16:21:32 INFO - Unpacking c:\slave\test\build\tests\mozbase\manifestparser 16:21:32 INFO - Running setup.py (path:c:\users\cltbld~1.t-w\appdata\local\temp\pip-xn_zma-build\setup.py) egg_info for package from file:///C:/slave/test/build/tests/mozbase/manifestparser 16:21:32 INFO - Unpacking c:\slave\test\build\tests\mozbase\mozcrash 16:21:32 INFO - Running setup.py (path:c:\users\cltbld~1.t-w\appdata\local\temp\pip-p2bfgw-build\setup.py) egg_info for package from file:///C:/slave/test/build/tests/mozbase/mozcrash 16:21:32 INFO - Unpacking c:\slave\test\build\tests\mozbase\mozdebug 16:21:32 INFO - Running setup.py (path:c:\users\cltbld~1.t-w\appdata\local\temp\pip-5juq6w-build\setup.py) egg_info for package from file:///C:/slave/test/build/tests/mozbase/mozdebug 16:21:32 INFO - Unpacking c:\slave\test\build\tests\mozbase\mozdevice 16:21:32 INFO - Running setup.py (path:c:\users\cltbld~1.t-w\appdata\local\temp\pip-xve0te-build\setup.py) egg_info for package from file:///C:/slave/test/build/tests/mozbase/mozdevice 16:21:32 INFO - Unpacking c:\slave\test\build\tests\mozbase\mozfile 16:21:32 INFO - Running setup.py (path:c:\users\cltbld~1.t-w\appdata\local\temp\pip-r1yxfz-build\setup.py) egg_info for package from file:///C:/slave/test/build/tests/mozbase/mozfile 16:21:32 INFO - Unpacking c:\slave\test\build\tests\mozbase\mozhttpd 16:21:32 INFO - Running setup.py (path:c:\users\cltbld~1.t-w\appdata\local\temp\pip-f6ldwt-build\setup.py) egg_info for package from file:///C:/slave/test/build/tests/mozbase/mozhttpd 16:21:32 INFO - Unpacking c:\slave\test\build\tests\mozbase\mozinfo 16:21:32 INFO - Running setup.py (path:c:\users\cltbld~1.t-w\appdata\local\temp\pip-ouafkx-build\setup.py) egg_info for package from file:///C:/slave/test/build/tests/mozbase/mozinfo 16:21:32 INFO - Unpacking c:\slave\test\build\tests\mozbase\mozinstall 16:21:32 INFO - Running setup.py (path:c:\users\cltbld~1.t-w\appdata\local\temp\pip-dw5i4s-build\setup.py) egg_info for package from file:///C:/slave/test/build/tests/mozbase/mozinstall 16:21:33 INFO - Unpacking c:\slave\test\build\tests\mozbase\mozleak 16:21:33 INFO - Running setup.py (path:c:\users\cltbld~1.t-w\appdata\local\temp\pip-w8vx38-build\setup.py) egg_info for package from file:///C:/slave/test/build/tests/mozbase/mozleak 16:21:33 INFO - Unpacking c:\slave\test\build\tests\mozbase\mozlog 16:21:33 INFO - Running setup.py (path:c:\users\cltbld~1.t-w\appdata\local\temp\pip-0d3myz-build\setup.py) egg_info for package from file:///C:/slave/test/build/tests/mozbase/mozlog 16:21:33 INFO - Unpacking c:\slave\test\build\tests\mozbase\moznetwork 16:21:33 INFO - Running setup.py (path:c:\users\cltbld~1.t-w\appdata\local\temp\pip-ext7hi-build\setup.py) egg_info for package from file:///C:/slave/test/build/tests/mozbase/moznetwork 16:21:33 INFO - Unpacking c:\slave\test\build\tests\mozbase\mozprocess 16:21:33 INFO - Running setup.py (path:c:\users\cltbld~1.t-w\appdata\local\temp\pip-un_0jh-build\setup.py) egg_info for package from file:///C:/slave/test/build/tests/mozbase/mozprocess 16:21:33 INFO - Unpacking c:\slave\test\build\tests\mozbase\mozprofile 16:21:33 INFO - Running setup.py (path:c:\users\cltbld~1.t-w\appdata\local\temp\pip-y4gdwx-build\setup.py) egg_info for package from file:///C:/slave/test/build/tests/mozbase/mozprofile 16:21:33 INFO - Unpacking c:\slave\test\build\tests\mozbase\mozrunner 16:21:33 INFO - Running setup.py (path:c:\users\cltbld~1.t-w\appdata\local\temp\pip-iyavnb-build\setup.py) egg_info for package from file:///C:/slave/test/build/tests/mozbase/mozrunner 16:21:33 INFO - Unpacking c:\slave\test\build\tests\mozbase\mozscreenshot 16:21:33 INFO - Running setup.py (path:c:\users\cltbld~1.t-w\appdata\local\temp\pip-y4pjee-build\setup.py) egg_info for package from file:///C:/slave/test/build/tests/mozbase/mozscreenshot 16:21:33 INFO - Unpacking c:\slave\test\build\tests\mozbase\moztest 16:21:33 INFO - Running setup.py (path:c:\users\cltbld~1.t-w\appdata\local\temp\pip-gyp7li-build\setup.py) egg_info for package from file:///C:/slave/test/build/tests/mozbase/moztest 16:21:33 INFO - Unpacking c:\slave\test\build\tests\mozbase\mozversion 16:21:33 INFO - Running setup.py (path:c:\users\cltbld~1.t-w\appdata\local\temp\pip-jybswd-build\setup.py) egg_info for package from file:///C:/slave/test/build/tests/mozbase/mozversion 16:21:34 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 16:21:34 INFO - Running setup.py install for manifestparser 16:21:34 INFO - Installing manifestparser-script.py script to C:\slave\test\build\venv\Scripts 16:21:34 INFO - Installing manifestparser.exe script to C:\slave\test\build\venv\Scripts 16:21:34 INFO - Running setup.py install for mozcrash 16:21:35 INFO - Running setup.py install for mozdebug 16:21:35 INFO - Running setup.py install for mozdevice 16:21:35 INFO - Installing sutini-script.py script to C:\slave\test\build\venv\Scripts 16:21:35 INFO - Installing sutini.exe script to C:\slave\test\build\venv\Scripts 16:21:35 INFO - Installing dm-script.py script to C:\slave\test\build\venv\Scripts 16:21:35 INFO - Installing dm.exe script to C:\slave\test\build\venv\Scripts 16:21:36 INFO - Running setup.py install for mozfile 16:21:36 INFO - Running setup.py install for mozhttpd 16:21:36 INFO - Installing mozhttpd-script.py script to C:\slave\test\build\venv\Scripts 16:21:36 INFO - Installing mozhttpd.exe script to C:\slave\test\build\venv\Scripts 16:21:36 INFO - Running setup.py install for mozinfo 16:21:36 INFO - Installing mozinfo-script.py script to C:\slave\test\build\venv\Scripts 16:21:36 INFO - Installing mozinfo.exe script to C:\slave\test\build\venv\Scripts 16:21:37 INFO - Running setup.py install for mozInstall 16:21:37 INFO - Installing moz_remove_from_system-script.py script to C:\slave\test\build\venv\Scripts 16:21:37 INFO - Installing moz_remove_from_system.exe script to C:\slave\test\build\venv\Scripts 16:21:37 INFO - Installing mozuninstall-script.py script to C:\slave\test\build\venv\Scripts 16:21:37 INFO - Installing mozuninstall.exe script to C:\slave\test\build\venv\Scripts 16:21:37 INFO - Installing mozinstall-script.py script to C:\slave\test\build\venv\Scripts 16:21:37 INFO - Installing mozinstall.exe script to C:\slave\test\build\venv\Scripts 16:21:37 INFO - Installing moz_add_to_system-script.py script to C:\slave\test\build\venv\Scripts 16:21:37 INFO - Installing moz_add_to_system.exe script to C:\slave\test\build\venv\Scripts 16:21:37 INFO - Running setup.py install for mozleak 16:21:37 INFO - Running setup.py install for mozlog 16:21:37 INFO - Installing structlog-script.py script to C:\slave\test\build\venv\Scripts 16:21:37 INFO - Installing structlog.exe script to C:\slave\test\build\venv\Scripts 16:21:38 INFO - Running setup.py install for moznetwork 16:21:38 INFO - Installing moznetwork-script.py script to C:\slave\test\build\venv\Scripts 16:21:38 INFO - Installing moznetwork.exe script to C:\slave\test\build\venv\Scripts 16:21:38 INFO - Running setup.py install for mozprocess 16:21:39 INFO - Running setup.py install for mozprofile 16:21:39 INFO - Installing mozprofile-script.py script to C:\slave\test\build\venv\Scripts 16:21:39 INFO - Installing mozprofile.exe script to C:\slave\test\build\venv\Scripts 16:21:39 INFO - Installing diff-profiles-script.py script to C:\slave\test\build\venv\Scripts 16:21:39 INFO - Installing diff-profiles.exe script to C:\slave\test\build\venv\Scripts 16:21:39 INFO - Installing view-profile-script.py script to C:\slave\test\build\venv\Scripts 16:21:39 INFO - Installing view-profile.exe script to C:\slave\test\build\venv\Scripts 16:21:40 INFO - Running setup.py install for mozrunner 16:21:40 INFO - Installing mozrunner-script.py script to C:\slave\test\build\venv\Scripts 16:21:40 INFO - Installing mozrunner.exe script to C:\slave\test\build\venv\Scripts 16:21:41 INFO - Running setup.py install for mozscreenshot 16:21:41 INFO - Running setup.py install for moztest 16:21:41 INFO - Running setup.py install for mozversion 16:21:41 INFO - Installing mozversion-script.py script to C:\slave\test\build\venv\Scripts 16:21:41 INFO - Installing mozversion.exe script to C:\slave\test\build\venv\Scripts 16:21:42 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 16:21:42 INFO - Cleaning up... 16:21:42 INFO - Return code: 0 16:21:42 INFO - Installing None into virtualenv C:\slave\test\build/venv 16:21:42 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 16:21:42 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 16:21:42 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 16:21:42 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 16:21:42 INFO - retry: Calling run_command with args: [['C:\\slave\\test\\build\\venv\\Scripts\\pip', 'install', '--download-cache', 'C:\\slave\\test\\build/venv\\cache', '--timeout', '120', '-r', 'C:\\slave\\test\\build\\tests\\config\\mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x023AFB10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x02371EA8>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x02449A90>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x01D98B48>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x01DBA700>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x0242A660>, 'level': 'critical'}], 'cwd': 'C:\\slave\\test\\build\\tests\\config', 'env': {'TMP': 'C:\\Users\\CLTBLD~1.T-W\\AppData\\Local\\Temp', 'TEST1': 'testie', 'COMPUTERNAME': 'T-W864-IX-155', 'USERDOMAIN': 'T-W864-IX-155', 'KTS_VERSION': '1.19c', 'PSMODULEPATH': 'C:\\windows\\system32\\WindowsPowerShell\\v1.0\\Modules\\', 'COMMONPROGRAMFILES': 'C:\\Program Files (x86)\\Common Files', 'PROCESSOR_IDENTIFIER': 'Intel64 Family 6 Model 30 Stepping 5, GenuineIntel', 'PROGRAMFILES': 'C:\\Program Files (x86)', 'PROCESSOR_REVISION': '1e05', 'DNSSUFFIX': 'wintest.releng.scl3.mozilla.com', 'SYSTEMROOT': 'C:\\windows', 'NO_EM_RESTART': '1', 'PROGRAMFILES(X86)': 'C:\\Program Files (x86)', 'OURDRIVE': 'C:', 'XPCOM_DEBUG_BREAK': 'warn', 'MONDIR': 'C:\\Monitor_config\\', 'TEMP': 'C:\\Users\\CLTBLD~1.T-W\\AppData\\Local\\Temp', 'COMMONPROGRAMFILES(X86)': 'C:\\Program Files (x86)\\Common Files', 'RUNLOGFILE': 'C:\\slave\\\\runslave.log', 'PROCESSOR_ARCHITECTURE': 'x86', 'ALLUSERSPROFILE': 'C:\\ProgramData', 'USERPROFILE': 'C:\\Users\\cltbld.T-W864-IX-155', 'LOCALAPPDATA': 'C:\\Users\\cltbld.T-W864-IX-155\\AppData\\Local', 'HOMEPATH': '\\Users\\cltbld.T-W864-IX-155', 'USERDOMAIN_ROAMINGPROFILE': 'T-W864-IX-155', 'MOZBUILDDIR': 'C:\\mozilla-build\\', 'PROGRAMW6432': 'C:\\Program Files', 'USERNAME': 'cltbld', 'LOGONSERVER': '\\\\T-W864-IX-155', 'MOZ_NO_REMOTE': '1', 'COMSPEC': 'C:\\windows\\system32\\cmd.exe', 'PROGRAMDATA': 'C:\\ProgramData', 'PROPERTIES_FILE': 'C:\\slave\\test/buildprops.json', 'PATH': 'C:\\Program Files (x86)\\NVIDIA Corporation\\PhysX\\Common;C:\\windows\\system32;C:\\windows;C:\\windows\\System32\\Wbem;C:\\windows\\System32\\WindowsPowerShell\\v1.0\\;C:\\mozilla-build\\python27;C:\\mozilla-build\\python27\\Scripts;C:\\mozilla-build\\msys\\bin;C:\\mozilla-build\\vim\\vim72;C:\\mozilla-build\\wget;C:\\mozilla-build\\info-zip;C:\\CoreUtils\\bin;C:\\mozilla-build\\buildbotve\\scripts;C:\\mozilla-build\\hg', 'PROMPT': '$P$G', 'PATHEXT': '.COM;.EXE;.BAT;.CMD;.VBS;.VBE;.JS;.JSE;.WSF;.WSH;.MSC', 'FP_NO_HOST_CHECK': 'NO', 'DCLOCATION': 'SCL3', 'APPDATA': 'C:\\Users\\cltbld.T-W864-IX-155\\AppData\\Roaming', 'HOMEDRIVE': 'C:', 'SYSTEMDRIVE': 'C:', 'SLAVEDIR': 'C:\\slave\\', 'NUMBER_OF_PROCESSORS': '8', 'PWD': 'C:\\slave\\test', 'PROCESSOR_LEVEL': '6', 'KTS_HOME': 'C:\\Program Files\\KTS', 'PROCESSOR_ARCHITEW6432': 'AMD64', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'COMMONPROGRAMW6432': 'C:\\Program Files\\Common Files', 'OS': 'Windows_NT', 'PUBLIC': 'C:\\Users\\Public', 'WINDIR': 'C:\\windows'}}, attempt #1 16:21:42 INFO - Running command: ['C:\\slave\\test\\build\\venv\\Scripts\\pip', 'install', '--download-cache', 'C:\\slave\\test\\build/venv\\cache', '--timeout', '120', '-r', 'C:\\slave\\test\\build\\tests\\config\\mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in C:\slave\test\build\tests\config 16:21:42 INFO - Copy/paste: C:\slave\test\build\venv\Scripts\pip install --download-cache C:\slave\test\build/venv\cache --timeout 120 -r C:\slave\test\build\tests\config\mozbase_requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 16:21:42 INFO - Using env: {'ALLUSERSPROFILE': 'C:\\ProgramData', 16:21:42 INFO - 'APPDATA': 'C:\\Users\\cltbld.T-W864-IX-155\\AppData\\Roaming', 16:21:42 INFO - 'COMMONPROGRAMFILES': 'C:\\Program Files (x86)\\Common Files', 16:21:42 INFO - 'COMMONPROGRAMFILES(X86)': 'C:\\Program Files (x86)\\Common Files', 16:21:42 INFO - 'COMMONPROGRAMW6432': 'C:\\Program Files\\Common Files', 16:21:42 INFO - 'COMPUTERNAME': 'T-W864-IX-155', 16:21:42 INFO - 'COMSPEC': 'C:\\windows\\system32\\cmd.exe', 16:21:42 INFO - 'DCLOCATION': 'SCL3', 16:21:42 INFO - 'DNSSUFFIX': 'wintest.releng.scl3.mozilla.com', 16:21:42 INFO - 'FP_NO_HOST_CHECK': 'NO', 16:21:42 INFO - 'HOMEDRIVE': 'C:', 16:21:42 INFO - 'HOMEPATH': '\\Users\\cltbld.T-W864-IX-155', 16:21:42 INFO - 'KTS_HOME': 'C:\\Program Files\\KTS', 16:21:42 INFO - 'KTS_VERSION': '1.19c', 16:21:42 INFO - 'LOCALAPPDATA': 'C:\\Users\\cltbld.T-W864-IX-155\\AppData\\Local', 16:21:42 INFO - 'LOGONSERVER': '\\\\T-W864-IX-155', 16:21:42 INFO - 'MONDIR': 'C:\\Monitor_config\\', 16:21:42 INFO - 'MOZBUILDDIR': 'C:\\mozilla-build\\', 16:21:42 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:21:42 INFO - 'MOZ_NO_REMOTE': '1', 16:21:42 INFO - 'NO_EM_RESTART': '1', 16:21:42 INFO - 'NUMBER_OF_PROCESSORS': '8', 16:21:42 INFO - 'OS': 'Windows_NT', 16:21:42 INFO - 'OURDRIVE': 'C:', 16:21:42 INFO - 'PATH': 'C:\\Program Files (x86)\\NVIDIA Corporation\\PhysX\\Common;C:\\windows\\system32;C:\\windows;C:\\windows\\System32\\Wbem;C:\\windows\\System32\\WindowsPowerShell\\v1.0\\;C:\\mozilla-build\\python27;C:\\mozilla-build\\python27\\Scripts;C:\\mozilla-build\\msys\\bin;C:\\mozilla-build\\vim\\vim72;C:\\mozilla-build\\wget;C:\\mozilla-build\\info-zip;C:\\CoreUtils\\bin;C:\\mozilla-build\\buildbotve\\scripts;C:\\mozilla-build\\hg', 16:21:42 INFO - 'PATHEXT': '.COM;.EXE;.BAT;.CMD;.VBS;.VBE;.JS;.JSE;.WSF;.WSH;.MSC', 16:21:42 INFO - 'PROCESSOR_ARCHITECTURE': 'x86', 16:21:42 INFO - 'PROCESSOR_ARCHITEW6432': 'AMD64', 16:21:42 INFO - 'PROCESSOR_IDENTIFIER': 'Intel64 Family 6 Model 30 Stepping 5, GenuineIntel', 16:21:42 INFO - 'PROCESSOR_LEVEL': '6', 16:21:42 INFO - 'PROCESSOR_REVISION': '1e05', 16:21:42 INFO - 'PROGRAMDATA': 'C:\\ProgramData', 16:21:42 INFO - 'PROGRAMFILES': 'C:\\Program Files (x86)', 16:21:42 INFO - 'PROGRAMFILES(X86)': 'C:\\Program Files (x86)', 16:21:42 INFO - 'PROGRAMW6432': 'C:\\Program Files', 16:21:42 INFO - 'PROMPT': '$P$G', 16:21:42 INFO - 'PROPERTIES_FILE': 'C:\\slave\\test/buildprops.json', 16:21:42 INFO - 'PSMODULEPATH': 'C:\\windows\\system32\\WindowsPowerShell\\v1.0\\Modules\\', 16:21:42 INFO - 'PUBLIC': 'C:\\Users\\Public', 16:21:42 INFO - 'PWD': 'C:\\slave\\test', 16:21:42 INFO - 'RUNLOGFILE': 'C:\\slave\\\\runslave.log', 16:21:42 INFO - 'SLAVEDIR': 'C:\\slave\\', 16:21:42 INFO - 'SYSTEMDRIVE': 'C:', 16:21:42 INFO - 'SYSTEMROOT': 'C:\\windows', 16:21:42 INFO - 'TEMP': 'C:\\Users\\CLTBLD~1.T-W\\AppData\\Local\\Temp', 16:21:42 INFO - 'TEST1': 'testie', 16:21:42 INFO - 'TMP': 'C:\\Users\\CLTBLD~1.T-W\\AppData\\Local\\Temp', 16:21:42 INFO - 'USERDOMAIN': 'T-W864-IX-155', 16:21:42 INFO - 'USERDOMAIN_ROAMINGPROFILE': 'T-W864-IX-155', 16:21:42 INFO - 'USERNAME': 'cltbld', 16:21:42 INFO - 'USERPROFILE': 'C:\\Users\\cltbld.T-W864-IX-155', 16:21:42 INFO - 'WINDIR': 'C:\\windows', 16:21:42 INFO - 'XPCOM_DEBUG_BREAK': 'warn'} 16:21:42 INFO - Ignoring indexes: https://pypi.python.org/simple/ 16:21:42 INFO - Unpacking c:\slave\test\build\tests\mozbase\manifestparser 16:21:42 INFO - Running setup.py (path:c:\users\cltbld~1.t-w\appdata\local\temp\pip-0mv_jy-build\setup.py) egg_info for package from file:///C:/slave/test/build/tests/mozbase/manifestparser 16:21:42 INFO - Requirement already satisfied (use --upgrade to upgrade): manifestparser==1.1 from file:///C:/slave/test/build/tests/mozbase/manifestparser in c:\slave\test\build\venv\lib\site-packages (from -r C:\slave\test\build\tests\config\mozbase_requirements.txt (line 1)) 16:21:42 INFO - Unpacking c:\slave\test\build\tests\mozbase\mozcrash 16:21:42 INFO - Running setup.py (path:c:\users\cltbld~1.t-w\appdata\local\temp\pip-l1dcws-build\setup.py) egg_info for package from file:///C:/slave/test/build/tests/mozbase/mozcrash 16:21:42 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash==0.16 from file:///C:/slave/test/build/tests/mozbase/mozcrash in c:\slave\test\build\venv\lib\site-packages (from -r C:\slave\test\build\tests\config\mozbase_requirements.txt (line 2)) 16:21:42 INFO - Unpacking c:\slave\test\build\tests\mozbase\mozdebug 16:21:42 INFO - Running setup.py (path:c:\users\cltbld~1.t-w\appdata\local\temp\pip-_m07wr-build\setup.py) egg_info for package from file:///C:/slave/test/build/tests/mozbase/mozdebug 16:21:42 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdebug==0.1 from file:///C:/slave/test/build/tests/mozbase/mozdebug in c:\slave\test\build\venv\lib\site-packages (from -r C:\slave\test\build\tests\config\mozbase_requirements.txt (line 3)) 16:21:42 INFO - Unpacking c:\slave\test\build\tests\mozbase\mozdevice 16:21:42 INFO - Running setup.py (path:c:\users\cltbld~1.t-w\appdata\local\temp\pip-rd2yvg-build\setup.py) egg_info for package from file:///C:/slave/test/build/tests/mozbase/mozdevice 16:21:43 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdevice==0.46 from file:///C:/slave/test/build/tests/mozbase/mozdevice in c:\slave\test\build\venv\lib\site-packages (from -r C:\slave\test\build\tests\config\mozbase_requirements.txt (line 4)) 16:21:43 INFO - Unpacking c:\slave\test\build\tests\mozbase\mozfile 16:21:43 INFO - Running setup.py (path:c:\users\cltbld~1.t-w\appdata\local\temp\pip-snzpbv-build\setup.py) egg_info for package from file:///C:/slave/test/build/tests/mozbase/mozfile 16:21:43 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile==1.2 from file:///C:/slave/test/build/tests/mozbase/mozfile in c:\slave\test\build\venv\lib\site-packages (from -r C:\slave\test\build\tests\config\mozbase_requirements.txt (line 5)) 16:21:43 INFO - Unpacking c:\slave\test\build\tests\mozbase\mozhttpd 16:21:43 INFO - Running setup.py (path:c:\users\cltbld~1.t-w\appdata\local\temp\pip-yxffue-build\setup.py) egg_info for package from file:///C:/slave/test/build/tests/mozbase/mozhttpd 16:21:43 INFO - Requirement already satisfied (use --upgrade to upgrade): mozhttpd==0.7 from file:///C:/slave/test/build/tests/mozbase/mozhttpd in c:\slave\test\build\venv\lib\site-packages (from -r C:\slave\test\build\tests\config\mozbase_requirements.txt (line 6)) 16:21:43 INFO - Unpacking c:\slave\test\build\tests\mozbase\mozinfo 16:21:43 INFO - Running setup.py (path:c:\users\cltbld~1.t-w\appdata\local\temp\pip-psxy1n-build\setup.py) egg_info for package from file:///C:/slave/test/build/tests/mozbase/mozinfo 16:21:43 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo==0.8 from file:///C:/slave/test/build/tests/mozbase/mozinfo in c:\slave\test\build\venv\lib\site-packages (from -r C:\slave\test\build\tests\config\mozbase_requirements.txt (line 7)) 16:21:43 INFO - Unpacking c:\slave\test\build\tests\mozbase\mozinstall 16:21:43 INFO - Running setup.py (path:c:\users\cltbld~1.t-w\appdata\local\temp\pip-gmshph-build\setup.py) egg_info for package from file:///C:/slave/test/build/tests/mozbase/mozinstall 16:21:43 INFO - Requirement already satisfied (use --upgrade to upgrade): mozInstall==1.12 from file:///C:/slave/test/build/tests/mozbase/mozinstall in c:\slave\test\build\venv\lib\site-packages (from -r C:\slave\test\build\tests\config\mozbase_requirements.txt (line 8)) 16:21:43 INFO - Unpacking c:\slave\test\build\tests\mozbase\mozleak 16:21:43 INFO - Running setup.py (path:c:\users\cltbld~1.t-w\appdata\local\temp\pip-2_bn9b-build\setup.py) egg_info for package from file:///C:/slave/test/build/tests/mozbase/mozleak 16:21:43 INFO - Requirement already satisfied (use --upgrade to upgrade): mozleak==0.1 from file:///C:/slave/test/build/tests/mozbase/mozleak in c:\slave\test\build\venv\lib\site-packages (from -r C:\slave\test\build\tests\config\mozbase_requirements.txt (line 9)) 16:21:43 INFO - Unpacking c:\slave\test\build\tests\mozbase\mozlog 16:21:43 INFO - Running setup.py (path:c:\users\cltbld~1.t-w\appdata\local\temp\pip-npdqwz-build\setup.py) egg_info for package from file:///C:/slave/test/build/tests/mozbase/mozlog 16:21:43 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog==3.0 from file:///C:/slave/test/build/tests/mozbase/mozlog in c:\slave\test\build\venv\lib\site-packages (from -r C:\slave\test\build\tests\config\mozbase_requirements.txt (line 10)) 16:21:43 INFO - Unpacking c:\slave\test\build\tests\mozbase\moznetwork 16:21:43 INFO - Running setup.py (path:c:\users\cltbld~1.t-w\appdata\local\temp\pip-hbbvoe-build\setup.py) egg_info for package from file:///C:/slave/test/build/tests/mozbase/moznetwork 16:21:43 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork==0.27 from file:///C:/slave/test/build/tests/mozbase/moznetwork in c:\slave\test\build\venv\lib\site-packages (from -r C:\slave\test\build\tests\config\mozbase_requirements.txt (line 11)) 16:21:43 INFO - Unpacking c:\slave\test\build\tests\mozbase\mozprocess 16:21:43 INFO - Running setup.py (path:c:\users\cltbld~1.t-w\appdata\local\temp\pip-ommlag-build\setup.py) egg_info for package from file:///C:/slave/test/build/tests/mozbase/mozprocess 16:21:43 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess==0.22 from file:///C:/slave/test/build/tests/mozbase/mozprocess in c:\slave\test\build\venv\lib\site-packages (from -r C:\slave\test\build\tests\config\mozbase_requirements.txt (line 12)) 16:21:43 INFO - Unpacking c:\slave\test\build\tests\mozbase\mozprofile 16:21:43 INFO - Running setup.py (path:c:\users\cltbld~1.t-w\appdata\local\temp\pip-ete6dd-build\setup.py) egg_info for package from file:///C:/slave/test/build/tests/mozbase/mozprofile 16:21:44 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile==0.27 from file:///C:/slave/test/build/tests/mozbase/mozprofile in c:\slave\test\build\venv\lib\site-packages (from -r C:\slave\test\build\tests\config\mozbase_requirements.txt (line 13)) 16:21:44 INFO - Unpacking c:\slave\test\build\tests\mozbase\mozrunner 16:21:44 INFO - Running setup.py (path:c:\users\cltbld~1.t-w\appdata\local\temp\pip-k6aku_-build\setup.py) egg_info for package from file:///C:/slave/test/build/tests/mozbase/mozrunner 16:21:44 INFO - Requirement already satisfied (use --upgrade to upgrade): mozrunner==6.10 from file:///C:/slave/test/build/tests/mozbase/mozrunner in c:\slave\test\build\venv\lib\site-packages (from -r C:\slave\test\build\tests\config\mozbase_requirements.txt (line 14)) 16:21:44 INFO - Unpacking c:\slave\test\build\tests\mozbase\mozscreenshot 16:21:44 INFO - Running setup.py (path:c:\users\cltbld~1.t-w\appdata\local\temp\pip-szb_ze-build\setup.py) egg_info for package from file:///C:/slave/test/build/tests/mozbase/mozscreenshot 16:21:44 INFO - Requirement already satisfied (use --upgrade to upgrade): mozscreenshot==0.1 from file:///C:/slave/test/build/tests/mozbase/mozscreenshot in c:\slave\test\build\venv\lib\site-packages (from -r C:\slave\test\build\tests\config\mozbase_requirements.txt (line 15)) 16:21:44 INFO - Unpacking c:\slave\test\build\tests\mozbase\moztest 16:21:44 INFO - Running setup.py (path:c:\users\cltbld~1.t-w\appdata\local\temp\pip-hzvvjl-build\setup.py) egg_info for package from file:///C:/slave/test/build/tests/mozbase/moztest 16:21:44 INFO - Requirement already satisfied (use --upgrade to upgrade): moztest==0.7 from file:///C:/slave/test/build/tests/mozbase/moztest in c:\slave\test\build\venv\lib\site-packages (from -r C:\slave\test\build\tests\config\mozbase_requirements.txt (line 16)) 16:21:44 INFO - Unpacking c:\slave\test\build\tests\mozbase\mozversion 16:21:44 INFO - Running setup.py (path:c:\users\cltbld~1.t-w\appdata\local\temp\pip-8nsqwf-build\setup.py) egg_info for package from file:///C:/slave/test/build/tests/mozbase/mozversion 16:21:44 INFO - Requirement already satisfied (use --upgrade to upgrade): mozversion==1.4 from file:///C:/slave/test/build/tests/mozbase/mozversion in c:\slave\test\build\venv\lib\site-packages (from -r C:\slave\test\build\tests\config\mozbase_requirements.txt (line 17)) 16:21:44 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.0 in c:\slave\test\build\venv\lib\site-packages (from mozcrash==0.16->-r C:\slave\test\build\tests\config\mozbase_requirements.txt (line 2)) 16:21:44 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.0 in c:\slave\test\build\venv\lib\site-packages (from mozcrash==0.16->-r C:\slave\test\build\tests\config\mozbase_requirements.txt (line 2)) 16:21:44 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo in c:\slave\test\build\venv\lib\site-packages (from mozdebug==0.1->-r C:\slave\test\build\tests\config\mozbase_requirements.txt (line 3)) 16:21:44 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in c:\slave\test\build\venv\lib\site-packages (from mozdevice==0.46->-r C:\slave\test\build\tests\config\mozbase_requirements.txt (line 4)) 16:21:44 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.19 in c:\slave\test\build\venv\lib\site-packages (from mozdevice==0.46->-r C:\slave\test\build\tests\config\mozbase_requirements.txt (line 4)) 16:21:44 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.0->-r C:\slave\test\build\tests\config\mozbase_requirements.txt (line 10)) 16:21:44 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 16:21:44 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 16:21:46 INFO - Downloading blessings-1.5.1.tar.gz 16:21:47 INFO - Storing download in cache at c:\slave\test\build\venv\cache\http%3a%2f%2fpypi.pvt.build.mozilla.org%2fpub%2fblessings-1.5.1.tar.gz 16:21:47 INFO - Running setup.py (path:C:\slave\test\build\venv\build\blessings\setup.py) egg_info for package blessings 16:21:47 INFO - Installing collected packages: blessings 16:21:47 INFO - Running setup.py install for blessings 16:21:47 INFO - Successfully installed blessings 16:21:47 INFO - Cleaning up... 16:21:50 INFO - Return code: 0 16:21:50 INFO - Done creating virtualenv C:\slave\test\build/venv. 16:21:50 INFO - Getting output from command: ['C:\\slave\\test\\build\\venv\\Scripts\\pip', 'freeze'] 16:21:50 INFO - Copy/paste: C:\slave\test\build\venv\Scripts\pip freeze 16:21:50 INFO - Reading from file tmpfile_stdout 16:21:50 INFO - Using _rmtree_windows ... 16:21:50 INFO - Using _rmtree_windows ... 16:21:50 INFO - Current package versions: 16:21:50 INFO - blessings == 1.5.1 16:21:50 INFO - blobuploader == 1.2.4 16:21:50 INFO - docopt == 0.6.1 16:21:50 INFO - manifestparser == 1.1 16:21:50 INFO - mozInstall == 1.12 16:21:50 INFO - mozcrash == 0.16 16:21:50 INFO - mozdebug == 0.1 16:21:50 INFO - mozdevice == 0.46 16:21:50 INFO - mozfile == 1.2 16:21:50 INFO - mozhttpd == 0.7 16:21:50 INFO - mozinfo == 0.8 16:21:50 INFO - mozleak == 0.1 16:21:50 INFO - mozlog == 3.0 16:21:50 INFO - moznetwork == 0.27 16:21:50 INFO - mozprocess == 0.22 16:21:50 INFO - mozprofile == 0.27 16:21:50 INFO - mozrunner == 6.10 16:21:50 INFO - mozscreenshot == 0.1 16:21:50 INFO - mozsystemmonitor == 0.0 16:21:50 INFO - moztest == 0.7 16:21:50 INFO - mozversion == 1.4 16:21:50 INFO - psutil == 3.1.1 16:21:50 INFO - requests == 1.2.3 16:21:50 INFO - Installing None into virtualenv C:\slave\test\build/venv 16:21:50 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 16:21:50 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 16:21:50 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 16:21:50 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 16:21:50 INFO - retry: Calling run_command with args: [['C:\\slave\\test\\build\\venv\\Scripts\\pip', 'install', '--download-cache', 'C:\\slave\\test\\build/venv\\cache', '--timeout', '120', '-r', 'C:\\slave\\test\\build\\tests\\talos\\requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x023AFB10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x02371EA8>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x02449A90>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x01D98B48>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x01DBA700>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x0242A660>, 'level': 'critical'}], 'cwd': 'C:\\slave\\test\\build\\tests\\talos', 'env': {'TMP': 'C:\\Users\\CLTBLD~1.T-W\\AppData\\Local\\Temp', 'TEST1': 'testie', 'COMPUTERNAME': 'T-W864-IX-155', 'USERDOMAIN': 'T-W864-IX-155', 'KTS_VERSION': '1.19c', 'PSMODULEPATH': 'C:\\windows\\system32\\WindowsPowerShell\\v1.0\\Modules\\', 'COMMONPROGRAMFILES': 'C:\\Program Files (x86)\\Common Files', 'PROCESSOR_IDENTIFIER': 'Intel64 Family 6 Model 30 Stepping 5, GenuineIntel', 'PROGRAMFILES': 'C:\\Program Files (x86)', 'PROCESSOR_REVISION': '1e05', 'DNSSUFFIX': 'wintest.releng.scl3.mozilla.com', 'SYSTEMROOT': 'C:\\windows', 'NO_EM_RESTART': '1', 'PROGRAMFILES(X86)': 'C:\\Program Files (x86)', 'OURDRIVE': 'C:', 'XPCOM_DEBUG_BREAK': 'warn', 'MONDIR': 'C:\\Monitor_config\\', 'TEMP': 'C:\\Users\\CLTBLD~1.T-W\\AppData\\Local\\Temp', 'COMMONPROGRAMFILES(X86)': 'C:\\Program Files (x86)\\Common Files', 'RUNLOGFILE': 'C:\\slave\\\\runslave.log', 'PROCESSOR_ARCHITECTURE': 'x86', 'ALLUSERSPROFILE': 'C:\\ProgramData', 'USERPROFILE': 'C:\\Users\\cltbld.T-W864-IX-155', 'LOCALAPPDATA': 'C:\\Users\\cltbld.T-W864-IX-155\\AppData\\Local', 'HOMEPATH': '\\Users\\cltbld.T-W864-IX-155', 'USERDOMAIN_ROAMINGPROFILE': 'T-W864-IX-155', 'MOZBUILDDIR': 'C:\\mozilla-build\\', 'PROGRAMW6432': 'C:\\Program Files', 'USERNAME': 'cltbld', 'LOGONSERVER': '\\\\T-W864-IX-155', 'MOZ_NO_REMOTE': '1', 'COMSPEC': 'C:\\windows\\system32\\cmd.exe', 'PROGRAMDATA': 'C:\\ProgramData', 'PROPERTIES_FILE': 'C:\\slave\\test/buildprops.json', 'PATH': 'C:\\Program Files (x86)\\NVIDIA Corporation\\PhysX\\Common;C:\\windows\\system32;C:\\windows;C:\\windows\\System32\\Wbem;C:\\windows\\System32\\WindowsPowerShell\\v1.0\\;C:\\mozilla-build\\python27;C:\\mozilla-build\\python27\\Scripts;C:\\mozilla-build\\msys\\bin;C:\\mozilla-build\\vim\\vim72;C:\\mozilla-build\\wget;C:\\mozilla-build\\info-zip;C:\\CoreUtils\\bin;C:\\mozilla-build\\buildbotve\\scripts;C:\\mozilla-build\\hg', 'PROMPT': '$P$G', 'PATHEXT': '.COM;.EXE;.BAT;.CMD;.VBS;.VBE;.JS;.JSE;.WSF;.WSH;.MSC', 'FP_NO_HOST_CHECK': 'NO', 'DCLOCATION': 'SCL3', 'APPDATA': 'C:\\Users\\cltbld.T-W864-IX-155\\AppData\\Roaming', 'HOMEDRIVE': 'C:', 'SYSTEMDRIVE': 'C:', 'SLAVEDIR': 'C:\\slave\\', 'NUMBER_OF_PROCESSORS': '8', 'PWD': 'C:\\slave\\test', 'PROCESSOR_LEVEL': '6', 'KTS_HOME': 'C:\\Program Files\\KTS', 'PROCESSOR_ARCHITEW6432': 'AMD64', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'COMMONPROGRAMW6432': 'C:\\Program Files\\Common Files', 'OS': 'Windows_NT', 'PUBLIC': 'C:\\Users\\Public', 'WINDIR': 'C:\\windows'}}, attempt #1 16:21:50 INFO - Running command: ['C:\\slave\\test\\build\\venv\\Scripts\\pip', 'install', '--download-cache', 'C:\\slave\\test\\build/venv\\cache', '--timeout', '120', '-r', 'C:\\slave\\test\\build\\tests\\talos\\requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in C:\slave\test\build\tests\talos 16:21:50 INFO - Copy/paste: C:\slave\test\build\venv\Scripts\pip install --download-cache C:\slave\test\build/venv\cache --timeout 120 -r C:\slave\test\build\tests\talos\requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 16:21:50 INFO - Using env: {'ALLUSERSPROFILE': 'C:\\ProgramData', 16:21:50 INFO - 'APPDATA': 'C:\\Users\\cltbld.T-W864-IX-155\\AppData\\Roaming', 16:21:50 INFO - 'COMMONPROGRAMFILES': 'C:\\Program Files (x86)\\Common Files', 16:21:50 INFO - 'COMMONPROGRAMFILES(X86)': 'C:\\Program Files (x86)\\Common Files', 16:21:50 INFO - 'COMMONPROGRAMW6432': 'C:\\Program Files\\Common Files', 16:21:50 INFO - 'COMPUTERNAME': 'T-W864-IX-155', 16:21:50 INFO - 'COMSPEC': 'C:\\windows\\system32\\cmd.exe', 16:21:50 INFO - 'DCLOCATION': 'SCL3', 16:21:50 INFO - 'DNSSUFFIX': 'wintest.releng.scl3.mozilla.com', 16:21:50 INFO - 'FP_NO_HOST_CHECK': 'NO', 16:21:50 INFO - 'HOMEDRIVE': 'C:', 16:21:50 INFO - 'HOMEPATH': '\\Users\\cltbld.T-W864-IX-155', 16:21:50 INFO - 'KTS_HOME': 'C:\\Program Files\\KTS', 16:21:50 INFO - 'KTS_VERSION': '1.19c', 16:21:50 INFO - 'LOCALAPPDATA': 'C:\\Users\\cltbld.T-W864-IX-155\\AppData\\Local', 16:21:50 INFO - 'LOGONSERVER': '\\\\T-W864-IX-155', 16:21:50 INFO - 'MONDIR': 'C:\\Monitor_config\\', 16:21:50 INFO - 'MOZBUILDDIR': 'C:\\mozilla-build\\', 16:21:50 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:21:50 INFO - 'MOZ_NO_REMOTE': '1', 16:21:50 INFO - 'NO_EM_RESTART': '1', 16:21:50 INFO - 'NUMBER_OF_PROCESSORS': '8', 16:21:50 INFO - 'OS': 'Windows_NT', 16:21:50 INFO - 'OURDRIVE': 'C:', 16:21:50 INFO - 'PATH': 'C:\\Program Files (x86)\\NVIDIA Corporation\\PhysX\\Common;C:\\windows\\system32;C:\\windows;C:\\windows\\System32\\Wbem;C:\\windows\\System32\\WindowsPowerShell\\v1.0\\;C:\\mozilla-build\\python27;C:\\mozilla-build\\python27\\Scripts;C:\\mozilla-build\\msys\\bin;C:\\mozilla-build\\vim\\vim72;C:\\mozilla-build\\wget;C:\\mozilla-build\\info-zip;C:\\CoreUtils\\bin;C:\\mozilla-build\\buildbotve\\scripts;C:\\mozilla-build\\hg', 16:21:50 INFO - 'PATHEXT': '.COM;.EXE;.BAT;.CMD;.VBS;.VBE;.JS;.JSE;.WSF;.WSH;.MSC', 16:21:50 INFO - 'PROCESSOR_ARCHITECTURE': 'x86', 16:21:50 INFO - 'PROCESSOR_ARCHITEW6432': 'AMD64', 16:21:50 INFO - 'PROCESSOR_IDENTIFIER': 'Intel64 Family 6 Model 30 Stepping 5, GenuineIntel', 16:21:50 INFO - 'PROCESSOR_LEVEL': '6', 16:21:50 INFO - 'PROCESSOR_REVISION': '1e05', 16:21:50 INFO - 'PROGRAMDATA': 'C:\\ProgramData', 16:21:50 INFO - 'PROGRAMFILES': 'C:\\Program Files (x86)', 16:21:50 INFO - 'PROGRAMFILES(X86)': 'C:\\Program Files (x86)', 16:21:50 INFO - 'PROGRAMW6432': 'C:\\Program Files', 16:21:50 INFO - 'PROMPT': '$P$G', 16:21:50 INFO - 'PROPERTIES_FILE': 'C:\\slave\\test/buildprops.json', 16:21:50 INFO - 'PSMODULEPATH': 'C:\\windows\\system32\\WindowsPowerShell\\v1.0\\Modules\\', 16:21:50 INFO - 'PUBLIC': 'C:\\Users\\Public', 16:21:50 INFO - 'PWD': 'C:\\slave\\test', 16:21:50 INFO - 'RUNLOGFILE': 'C:\\slave\\\\runslave.log', 16:21:50 INFO - 'SLAVEDIR': 'C:\\slave\\', 16:21:50 INFO - 'SYSTEMDRIVE': 'C:', 16:21:50 INFO - 'SYSTEMROOT': 'C:\\windows', 16:21:50 INFO - 'TEMP': 'C:\\Users\\CLTBLD~1.T-W\\AppData\\Local\\Temp', 16:21:50 INFO - 'TEST1': 'testie', 16:21:50 INFO - 'TMP': 'C:\\Users\\CLTBLD~1.T-W\\AppData\\Local\\Temp', 16:21:50 INFO - 'USERDOMAIN': 'T-W864-IX-155', 16:21:50 INFO - 'USERDOMAIN_ROAMINGPROFILE': 'T-W864-IX-155', 16:21:50 INFO - 'USERNAME': 'cltbld', 16:21:50 INFO - 'USERPROFILE': 'C:\\Users\\cltbld.T-W864-IX-155', 16:21:50 INFO - 'WINDIR': 'C:\\windows', 16:21:50 INFO - 'XPCOM_DEBUG_BREAK': 'warn'} 16:21:51 INFO - Ignoring indexes: https://pypi.python.org/simple/ 16:21:51 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash>=0.15 in c:\slave\test\build\venv\lib\site-packages (from -r C:\slave\test\build\tests\talos\requirements.txt (line 1)) 16:21:51 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.2 in c:\slave\test\build\venv\lib\site-packages (from -r C:\slave\test\build\tests\talos\requirements.txt (line 2)) 16:21:51 INFO - Requirement already satisfied (use --upgrade to upgrade): mozhttpd>=0.7 in c:\slave\test\build\venv\lib\site-packages (from -r C:\slave\test\build\tests\talos\requirements.txt (line 3)) 16:21:51 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo>=0.8 in c:\slave\test\build\venv\lib\site-packages (from -r C:\slave\test\build\tests\talos\requirements.txt (line 4)) 16:21:51 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.22 in c:\slave\test\build\venv\lib\site-packages (from -r C:\slave\test\build\tests\talos\requirements.txt (line 5)) 16:21:51 INFO - Requirement already satisfied (use --upgrade to upgrade): mozversion>=1.3 in c:\slave\test\build\venv\lib\site-packages (from -r C:\slave\test\build\tests\talos\requirements.txt (line 6)) 16:21:51 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile>=0.25 in c:\slave\test\build\venv\lib\site-packages (from -r C:\slave\test\build\tests\talos\requirements.txt (line 7)) 16:21:51 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in c:\slave\test\build\venv\lib\site-packages (from -r C:\slave\test\build\tests\talos\requirements.txt (line 8)) 16:21:51 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.0 in c:\slave\test\build\venv\lib\site-packages (from mozcrash>=0.15->-r C:\slave\test\build\tests\talos\requirements.txt (line 1)) 16:21:51 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in c:\slave\test\build\venv\lib\site-packages (from mozhttpd>=0.7->-r C:\slave\test\build\tests\talos\requirements.txt (line 3)) 16:21:51 INFO - Requirement already satisfied (use --upgrade to upgrade): blessings>=1.3 in c:\slave\test\build\venv\lib\site-packages (from mozlog>=3.0->mozcrash>=0.15->-r C:\slave\test\build\tests\talos\requirements.txt (line 1)) 16:21:51 INFO - Cleaning up... 16:21:51 INFO - Return code: 0 16:21:51 INFO - Running post-action listener: _resource_record_post_action 16:21:51 INFO - Running post-action listener: _start_resource_monitoring 16:21:51 INFO - Starting resource monitoring. 16:21:51 INFO - ##### 16:21:51 INFO - ##### Running install step. 16:21:51 INFO - ##### 16:21:51 INFO - Running pre-action listener: _resource_record_pre_action 16:21:51 INFO - Running main action method: install 16:21:51 INFO - Getting output from command: ['C:\\slave\\test\\build\\venv\\Scripts\\pip', 'freeze'] 16:21:51 INFO - Copy/paste: C:\slave\test\build\venv\Scripts\pip freeze 16:21:51 INFO - Reading from file tmpfile_stdout 16:21:51 INFO - Using _rmtree_windows ... 16:21:51 INFO - Using _rmtree_windows ... 16:21:51 INFO - Detecting whether we're running mozinstall >=1.0... 16:21:51 INFO - Getting output from command: ['C:\\slave\\test\\build/venv/scripts/python', 'C:\\slave\\test\\build/venv/scripts/mozinstall-script.py', '-h'] 16:21:51 INFO - Copy/paste: C:\slave\test\build/venv/scripts/python C:\slave\test\build/venv/scripts/mozinstall-script.py -h 16:21:51 INFO - Reading from file tmpfile_stdout 16:21:51 INFO - Output received: 16:21:51 INFO - Usage: mozinstall-script.py [options] installer 16:21:51 INFO - Options: 16:21:51 INFO - -h, --help show this help message and exit 16:21:51 INFO - -d DEST, --destination=DEST 16:21:51 INFO - Directory to install application into. [default: 16:21:51 INFO - "C:\slave\test"] 16:21:51 INFO - --app=APP Application being installed. [default: firefox] 16:21:51 INFO - Using _rmtree_windows ... 16:21:51 INFO - Using _rmtree_windows ... 16:21:51 INFO - mkdir: C:\slave\test\build\application 16:21:51 INFO - Getting output from command: ['C:\\slave\\test\\build/venv/scripts/python', 'C:\\slave\\test\\build/venv/scripts/mozinstall-script.py', 'C:\\slave\\test\\build\\firefox-44.0a1.en-US.win64.zip', '--destination', 'C:\\slave\\test\\build\\application'] 16:21:51 INFO - Copy/paste: C:\slave\test\build/venv/scripts/python C:\slave\test\build/venv/scripts/mozinstall-script.py C:\slave\test\build\firefox-44.0a1.en-US.win64.zip --destination C:\slave\test\build\application 16:21:53 INFO - Reading from file tmpfile_stdout 16:21:53 INFO - Output received: 16:21:53 INFO - C:\slave\test\build\application\firefox\firefox.exe 16:21:53 INFO - Using _rmtree_windows ... 16:21:53 INFO - Using _rmtree_windows ... 16:21:53 INFO - Running post-action listener: _resource_record_post_action 16:21:53 INFO - ##### 16:21:53 INFO - ##### Running run-tests step. 16:21:53 INFO - ##### 16:21:53 INFO - Running pre-action listener: _resource_record_pre_action 16:21:53 INFO - Running main action method: run_tests 16:21:53 INFO - Running command: ['C:\\slave\\test\\build\\venv\\Scripts\\python', '--version'] 16:21:53 INFO - Copy/paste: C:\slave\test\build\venv\Scripts\python --version 16:21:53 INFO - Python 2.7.3 16:21:53 INFO - Return code: 0 16:21:53 INFO - grabbing minidump binary from tooltool 16:21:53 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 16:21:53 INFO - retry: Calling run_command with args: (['c:/mozilla-build/python27/python.exe', 'C:/mozilla-build/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', 'c:\\builds\\relengapi.tok', 'fetch', '-m', 'C:\\slave\\test\\build\\tests\\config/tooltool-manifests/win32/releng.manifest', '-o'],), kwargs: {'error_list': [{'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x01D98B48>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x01DBA700>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x0242A660>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': 'C:\\slave\\test\\build', 'privileged': False}, attempt #1 16:21:53 INFO - Running command: ['c:/mozilla-build/python27/python.exe', 'C:/mozilla-build/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', 'c:\\builds\\relengapi.tok', 'fetch', '-m', 'C:\\slave\\test\\build\\tests\\config/tooltool-manifests/win32/releng.manifest', '-o'] in C:\slave\test\build 16:21:53 INFO - Copy/paste: c:/mozilla-build/python27/python.exe C:/mozilla-build/tooltool.py --url https://api.pub.build.mozilla.org/tooltool/ --authentication-file c:\builds\relengapi.tok fetch -m C:\slave\test\build\tests\config/tooltool-manifests/win32/releng.manifest -o 16:21:54 INFO - INFO - Attempting to fetch from 'https://api.pub.build.mozilla.org/tooltool/'... 16:21:57 INFO - INFO - File win32-minidump_stackwalk.exe fetched from https://api.pub.build.mozilla.org/tooltool/ as C:\slave\test\build\tmpnida44 16:21:57 INFO - INFO - File integrity verified, renaming tmpnida44 to win32-minidump_stackwalk.exe 16:21:57 INFO - Return code: 0 16:21:57 INFO - Chmoding C:\slave\test\build\win32-minidump_stackwalk.exe to 0755 16:21:57 INFO - mkdir: C:\slave\test\build\blobber_upload_dir 16:21:57 INFO - ENV: MOZ_UPLOAD_DIR is now C:\slave\test\build\blobber_upload_dir 16:21:57 INFO - ENV: MINIDUMP_STACKWALK is now C:\slave\test\build\win32-minidump_stackwalk.exe 16:21:57 INFO - ENV: MINIDUMP_SAVE_PATH is now C:\slave\test\build\blobber_upload_dir 16:21:57 INFO - Running command: ['C:\\slave\\test\\build\\venv\\Scripts\\python', 'C:\\slave\\test\\build\\tests\\talos\\talos\\run_tests.py', '--debug', '--branchName', 'Fx-Team-Non-PGO', '--suite', 'dromaeojs', '--executablePath', 'C:\\slave\\test\\build\\application\\firefox\\firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/lUgcNblFQ5mf-T41YEPb_Q/artifacts/public/build/firefox-44.0a1.en-US.win64.crashreporter-symbols.zip', '--title', 'T-W864-IX-155', '--webServer', 'localhost'] in C:\slave\test\build 16:21:57 INFO - Copy/paste: C:\slave\test\build\venv\Scripts\python C:\slave\test\build\tests\talos\talos\run_tests.py --debug --branchName Fx-Team-Non-PGO --suite dromaeojs --executablePath C:\slave\test\build\application\firefox\firefox --symbolsPath https://queue.taskcluster.net/v1/task/lUgcNblFQ5mf-T41YEPb_Q/artifacts/public/build/firefox-44.0a1.en-US.win64.crashreporter-symbols.zip --title T-W864-IX-155 --webServer localhost 16:21:57 INFO - Using env: {'ALLUSERSPROFILE': 'C:\\ProgramData', 16:21:57 INFO - 'APPDATA': 'C:\\Users\\cltbld.T-W864-IX-155\\AppData\\Roaming', 16:21:57 INFO - 'COMMONPROGRAMFILES': 'C:\\Program Files (x86)\\Common Files', 16:21:57 INFO - 'COMMONPROGRAMFILES(X86)': 'C:\\Program Files (x86)\\Common Files', 16:21:57 INFO - 'COMMONPROGRAMW6432': 'C:\\Program Files\\Common Files', 16:21:57 INFO - 'COMPUTERNAME': 'T-W864-IX-155', 16:21:57 INFO - 'COMSPEC': 'C:\\windows\\system32\\cmd.exe', 16:21:57 INFO - 'DCLOCATION': 'SCL3', 16:21:57 INFO - 'DNSSUFFIX': 'wintest.releng.scl3.mozilla.com', 16:21:57 INFO - 'FP_NO_HOST_CHECK': 'NO', 16:21:57 INFO - 'HOMEDRIVE': 'C:', 16:21:57 INFO - 'HOMEPATH': '\\Users\\cltbld.T-W864-IX-155', 16:21:57 INFO - 'KTS_HOME': 'C:\\Program Files\\KTS', 16:21:57 INFO - 'KTS_VERSION': '1.19c', 16:21:57 INFO - 'LOCALAPPDATA': 'C:\\Users\\cltbld.T-W864-IX-155\\AppData\\Local', 16:21:57 INFO - 'LOGONSERVER': '\\\\T-W864-IX-155', 16:21:57 INFO - 'MINIDUMP_SAVE_PATH': 'C:\\slave\\test\\build\\blobber_upload_dir', 16:21:57 INFO - 'MINIDUMP_STACKWALK': 'C:\\slave\\test\\build\\win32-minidump_stackwalk.exe', 16:21:57 INFO - 'MONDIR': 'C:\\Monitor_config\\', 16:21:57 INFO - 'MOZBUILDDIR': 'C:\\mozilla-build\\', 16:21:57 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:21:57 INFO - 'MOZ_NO_REMOTE': '1', 16:21:57 INFO - 'MOZ_UPLOAD_DIR': 'C:\\slave\\test\\build\\blobber_upload_dir', 16:21:57 INFO - 'NO_EM_RESTART': '1', 16:21:57 INFO - 'NUMBER_OF_PROCESSORS': '8', 16:21:57 INFO - 'OS': 'Windows_NT', 16:21:57 INFO - 'OURDRIVE': 'C:', 16:21:57 INFO - 'PATH': 'C:\\Program Files (x86)\\NVIDIA Corporation\\PhysX\\Common;C:\\windows\\system32;C:\\windows;C:\\windows\\System32\\Wbem;C:\\windows\\System32\\WindowsPowerShell\\v1.0\\;C:\\mozilla-build\\python27;C:\\mozilla-build\\python27\\Scripts;C:\\mozilla-build\\msys\\bin;C:\\mozilla-build\\vim\\vim72;C:\\mozilla-build\\wget;C:\\mozilla-build\\info-zip;C:\\CoreUtils\\bin;C:\\mozilla-build\\buildbotve\\scripts;C:\\mozilla-build\\hg', 16:21:57 INFO - 'PATHEXT': '.COM;.EXE;.BAT;.CMD;.VBS;.VBE;.JS;.JSE;.WSF;.WSH;.MSC', 16:21:57 INFO - 'PROCESSOR_ARCHITECTURE': 'x86', 16:21:57 INFO - 'PROCESSOR_ARCHITEW6432': 'AMD64', 16:21:57 INFO - 'PROCESSOR_IDENTIFIER': 'Intel64 Family 6 Model 30 Stepping 5, GenuineIntel', 16:21:57 INFO - 'PROCESSOR_LEVEL': '6', 16:21:57 INFO - 'PROCESSOR_REVISION': '1e05', 16:21:57 INFO - 'PROGRAMDATA': 'C:\\ProgramData', 16:21:57 INFO - 'PROGRAMFILES': 'C:\\Program Files (x86)', 16:21:57 INFO - 'PROGRAMFILES(X86)': 'C:\\Program Files (x86)', 16:21:57 INFO - 'PROGRAMW6432': 'C:\\Program Files', 16:21:57 INFO - 'PROMPT': '$P$G', 16:21:57 INFO - 'PROPERTIES_FILE': 'C:\\slave\\test/buildprops.json', 16:21:57 INFO - 'PSMODULEPATH': 'C:\\windows\\system32\\WindowsPowerShell\\v1.0\\Modules\\', 16:21:57 INFO - 'PUBLIC': 'C:\\Users\\Public', 16:21:57 INFO - 'PWD': 'C:\\slave\\test', 16:21:57 INFO - 'PYTHONPATH': 'C:\\slave\\test\\build\\tests\\talos', 16:21:57 INFO - 'RUNLOGFILE': 'C:\\slave\\\\runslave.log', 16:21:57 INFO - 'SLAVEDIR': 'C:\\slave\\', 16:21:57 INFO - 'SYSTEMDRIVE': 'C:', 16:21:57 INFO - 'SYSTEMROOT': 'C:\\windows', 16:21:57 INFO - 'TEMP': 'C:\\Users\\CLTBLD~1.T-W\\AppData\\Local\\Temp', 16:21:57 INFO - 'TEST1': 'testie', 16:21:57 INFO - 'TMP': 'C:\\Users\\CLTBLD~1.T-W\\AppData\\Local\\Temp', 16:21:57 INFO - 'USERDOMAIN': 'T-W864-IX-155', 16:21:57 INFO - 'USERDOMAIN_ROAMINGPROFILE': 'T-W864-IX-155', 16:21:57 INFO - 'USERNAME': 'cltbld', 16:21:57 INFO - 'USERPROFILE': 'C:\\Users\\cltbld.T-W864-IX-155', 16:21:57 INFO - 'WINDIR': 'C:\\windows', 16:21:57 INFO - 'XPCOM_DEBUG_BREAK': 'warn'} 16:21:57 INFO - Calling ['C:\\slave\\test\\build\\venv\\Scripts\\python', 'C:\\slave\\test\\build\\tests\\talos\\talos\\run_tests.py', '--debug', '--branchName', 'Fx-Team-Non-PGO', '--suite', 'dromaeojs', '--executablePath', 'C:\\slave\\test\\build\\application\\firefox\\firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/lUgcNblFQ5mf-T41YEPb_Q/artifacts/public/build/firefox-44.0a1.en-US.win64.crashreporter-symbols.zip', '--title', 'T-W864-IX-155', '--webServer', 'localhost'] with output_timeout 3600 ProcessManager NOT managing child processes ProcessManager UNABLE to use job objects to manage child processes 16:21:59 INFO - mozversion INFO | application_buildid: 20151022143900 16:21:59 INFO - mozversion INFO | application_changeset: ddb5b8e191c9e6cd1f8f1b6c7524eab20747a402 16:21:59 INFO - mozversion INFO | application_display_name: Nightly 16:21:59 INFO - mozversion INFO | application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 16:21:59 INFO - mozversion INFO | application_name: Firefox 16:21:59 INFO - mozversion INFO | application_remotingname: firefox 16:21:59 INFO - mozversion INFO | application_repository: https://hg.mozilla.org/integration/fx-team 16:21:59 INFO - mozversion INFO | application_vendor: Mozilla 16:21:59 INFO - mozversion INFO | application_version: 44.0a1 16:21:59 INFO - mozversion INFO | platform_buildid: 20151022143900 16:21:59 INFO - mozversion INFO | platform_changeset: ddb5b8e191c9e6cd1f8f1b6c7524eab20747a402 16:21:59 INFO - mozversion INFO | platform_repository: https://hg.mozilla.org/integration/fx-team 16:21:59 INFO - mozversion INFO | platform_version: 44.0a1 16:21:59 INFO - 2015-10-22 16:21:59,720 DEBUG : using testdate: 1445556119 16:21:59 INFO - 2015-10-22 16:21:59,720 DEBUG : actual date: 1445556119 16:21:59 INFO - 2015-10-22 16:21:59,930 INFO : starting webserver on 'localhost:49238' 16:21:59 INFO - 2015-10-22 16:21:59,933 INFO : Starting test suite T-W864-IX-155 16:21:59 INFO - 2015-10-22 16:21:59,933 INFO : Starting test dromaeo_css 16:21:59 INFO - 2015-10-22 16:21:59,933 DEBUG : operating with platform_type : w8_ 16:21:59 INFO - 2015-10-22 16:21:59,933 INFO : Initialising browser for dromaeo_css test... 16:22:00 INFO - 2015-10-22 16:22:00,124 DEBUG : command line: C:\slave\test\build\application\firefox\firefox -profile c:\users\cltbld~1.t-w\appdata\local\temp\tmpwrvjoa\profile http://localhost:49238/getInfo.html 16:22:16 INFO - 2015-10-22 16:22:16,368 DEBUG : BROWSER_OUTPUT: __metrics Screen width/height:1600/1200 16:22:16 INFO - 2015-10-22 16:22:16,368 DEBUG : BROWSER_OUTPUT: colorDepth:24 16:22:16 INFO - 2015-10-22 16:22:16,368 DEBUG : BROWSER_OUTPUT: Browser inner width/height: 1010/674 16:22:16 INFO - 2015-10-22 16:22:16,368 DEBUG : BROWSER_OUTPUT: __metrics 16:22:16 INFO - 2015-10-22 16:22:16,549 DEBUG : BROWSER_OUTPUT: JavaScript error: resource:///modules/WebappManager.jsm, line 48: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 16:22:19 INFO - 2015-10-22 16:22:19,788 INFO : Browser initialized. 16:22:19 INFO - 2015-10-22 16:22:19,788 INFO : Running cycle 1/1 for dromaeo_css test... 16:22:19 INFO - 2015-10-22 16:22:19,788 DEBUG : command line: C:\slave\test\build\application\firefox\firefox -profile c:\users\cltbld~1.t-w\appdata\local\temp\tmpwrvjoa\profile -tp file:\C:\slave\test\build\tests\talos\talos\tests\dromaeo\css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1 16:22:31 INFO - 2015-10-22 16:22:31,361 DEBUG : BROWSER_OUTPUT: RSS: Main: 178450432 16:22:31 INFO - 2015-10-22 16:22:31,361 DEBUG : BROWSER_OUTPUT: 16:23:22 INFO - 2015-10-22 16:23:22,687 DEBUG : BROWSER_OUTPUT: 1445556202685 addons.productaddons ERROR Request failed certificate checks: [Exception... "SSL is required and URI scheme is not https." nsresult: "0x8000ffff (NS_ERROR_UNEXPECTED)" location: "JS frame :: resource://gre/modules/CertUtils.jsm :: checkCert :: line 145" data: no] 16:25:31 INFO - 2015-10-22 16:25:31,852 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49238/tests/dromaeo/cssquery-dojo.html (next: http://localhost:49238/tests/dromaeo/cssquery-ext.html) 16:25:32 INFO - 2015-10-22 16:25:32,959 DEBUG : BROWSER_OUTPUT: RSS: Main: 210006016 16:25:32 INFO - 2015-10-22 16:25:32,959 DEBUG : BROWSER_OUTPUT: 16:28:35 INFO - 2015-10-22 16:28:35,986 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49238/tests/dromaeo/cssquery-ext.html (next: http://localhost:49238/tests/dromaeo/cssquery-jquery.html) 16:28:36 INFO - 2015-10-22 16:28:36,549 DEBUG : BROWSER_OUTPUT: RSS: Main: 222879744 16:28:36 INFO - 2015-10-22 16:28:36,549 DEBUG : BROWSER_OUTPUT: 16:31:38 INFO - 2015-10-22 16:31:38,871 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49238/tests/dromaeo/cssquery-jquery.html (next: http://localhost:49238/tests/dromaeo/cssquery-mootools.html) 16:31:39 INFO - 2015-10-22 16:31:39,436 DEBUG : BROWSER_OUTPUT: RSS: Main: 197689344 16:31:39 INFO - 2015-10-22 16:31:39,437 DEBUG : BROWSER_OUTPUT: 16:34:41 INFO - 2015-10-22 16:34:41,642 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49238/tests/dromaeo/cssquery-mootools.html (next: http://localhost:49238/tests/dromaeo/cssquery-prototype.html) 16:34:42 INFO - 2015-10-22 16:34:42,207 DEBUG : BROWSER_OUTPUT: RSS: Main: 160800768 16:34:42 INFO - 2015-10-22 16:34:42,207 DEBUG : BROWSER_OUTPUT: 16:37:45 INFO - 2015-10-22 16:37:45,325 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49238/tests/dromaeo/cssquery-prototype.html (next: http://localhost:49238/tests/dromaeo/cssquery-yui.html) 16:37:45 INFO - 2015-10-22 16:37:45,901 DEBUG : BROWSER_OUTPUT: RSS: Main: 168611840 16:37:45 INFO - 2015-10-22 16:37:45,901 DEBUG : BROWSER_OUTPUT: 16:40:48 INFO - 2015-10-22 16:40:48,801 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49238/tests/dromaeo/cssquery-yui.html (next: http://localhost:49238/tests/dromaeo/cssquery-dojo.html) 16:40:49 INFO - 2015-10-22 16:40:49,052 DEBUG : BROWSER_OUTPUT: RSS: Main: 219582464 16:40:49 INFO - 2015-10-22 16:40:49,052 DEBUG : BROWSER_OUTPUT: 16:40:49 INFO - 2015-10-22 16:40:49,052 DEBUG : BROWSER_OUTPUT: __start_tp_report 16:40:49 INFO - 2015-10-22 16:40:49,053 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load 16:40:49 INFO - 2015-10-22 16:40:49,053 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load_details 16:40:49 INFO - 2015-10-22 16:40:49,053 DEBUG : BROWSER_OUTPUT: |i|pagename|runs| 16:40:49 INFO - 2015-10-22 16:40:49,053 DEBUG : BROWSER_OUTPUT: |0;dojo.html;2627.093652689822;2675.7458041486066;2699.6355492008574;2700.8109432339743;2718.768904643105;4833.589144922681;4859.854204373865;4863.562279394854;4867.221244600869;4925.433575138851;4865.075635629228;4867.367242258501;4869.001854619803;4884.413870335565;4936.629752768547;4217.683673724468;4340.913181736363;4433.312836510346;4436.55634436557;4438.894587402816;4308.590683885026;4314.245007123741;4383.671224658147;4384.649228061763;4435.600795928366;4363.672724545656;4376.541736293464;4389.1660584488845;4413.7793110344355;4425.690201685883;4209.873703788891;4261.97869010653;4328.026194106333;4389;4450.732956022649;4290;4308.633766129851;4323.178596066738;4363.061941682522;4411.757353345564;4736.407949006374;4742.549457801538;4758.500357462452;4789.257665061921;4801.903961920777;4864.391951006124;5025.195968644999;5053.570446512051;5056.292119103292;5079.79680812767;4930.260460930853;4951.430585482643;5018.64869459138;5021.422536408323;5049.116404629175;4722.669413141081;4733.431988161443;4736.715797052153;4736.9526304736855;4791.113643975876;4980.302757613937;5164.535191832753;5184.533391994739;5192.948070519322;5196.948030519722;4898.167311557044;4957.553820156131;4976.552110310017;4984.102861484967;5026.723530205873;5092.6435149539175;5093.592512598983;5097.796088156507;5098.694078355311;5102;4739.075880203396;5014.147594908802;5030.673006254655;5040.697558146523;5048.697078175322;4795.6163506919365;4863.805447782049;4923.089228492669;4965.478624744422;4981.327520784647;3351.798892066484;3355.9496607550905;3362.075429256974;3376.9493457598155;3399.983000084984;2995.6255468066493;3085.8765649374222;3112.813231206135;3132.436161490908;3139.105354973867;4611.8847028823875;4644;4657.184992626277;4699.812007519729;4729.243321068612;5068.974655126774;5077.923831142536;5082.567981721521;5090.032893750175;5140.537351638296;4569.748663823521;4652.371929789503;4694.413198350207;4700.529947005272;4757.785899634525;4109.547949725527;4151.315033019579;4151.418801367811;4172.01957539984;4201.97899010503;5089.211172268304;5110.821121260738;5111.616628752859;5126.820561280412;5174.715390653475;4858.562729354375;5096.821611243588;5100.948990510047;5101.617378696538;5144.819931302386;4987.825426110068;5048.242763585345;5058.1654027085115;5075.187969924795;5095.694258344512;4931.72875491837;4938.530839570379;5013.548780609763;5017.297578338962;5050.090983622983;4829.420469543677;5001.824936127218;5012.1980483122525;5043.4956504349275;5044.974775126101;4828.5412885775795;4852.126617208936;4922.163232250455;4926.950730492793;4951.059298733229;4923.483034281349;4967.081089998362;4975.875603109951;4991.650584459053;4992.350994370709;4673.859784206479;4916.655834091579;4924;4939.728314942713;4959.677620954626;4850.684705494273;4963.354763880672;4969.701817890938;4982.67612605194;5004.074246264453;4716.457607375196;4926.359573255454;4933.654644174873;4950.504949505164;4986.12742770021 16:40:49 INFO - 2015-10-22 16:40:49,053 DEBUG : BROWSER_OUTPUT: |1;ext.html;551;552.8175702018334;564.3087218157757;567.4325674325675;570;28668.56997145042;29021;29048.419031619356;35985.2802943941;36387;39337.80331098341;39726;39814;39818;40102.79948600253;7860.803479913005;7942.602869856484;8001.8799718004275;8007.599620019005;8007.719729809458;7647.847043059135;7826;8429.409941304111;10312.381257124596;10558.577656893714;9918.851217231711;9959.950200249024;9961.153301969342;10019.398836069822;10038.196944244479;7549.698012079511;10054.949725251363;10115.848262276071;10155.18758499322;10160.745981350452;7457.701691932316;10067.489876518508;10184.236182286284;10276.537555810006;10283.640072597424;36981.44527832085;37561.43657845134;37587.62412375869;37639.81180094082;37727.622723772685;3037.331787006855;3072.078376487045;3092.567040614316;3176.3329700762865;3559.0746405934383;27563.586546201823;27830.3042423939;27952.860235698692;28150.577741333895;28446.431071378458;2663.8401695898115;2675.2241849863517;2708.444768822387;2735.945281094367;2805.5931889876056;222543;223033;223729;223845.09239260983;224352;44584.3312350315;45184.54815451869;52821.471785281654;53136.468635313155;53356.19965700518;49430.75284623626;49717.25424118641;49786.25320620194;49811;49926.27174983316;12992;13095.934520327337;13142.474301028044;13193.802092968614;13223.66940826487;9270.980192178855;9353;9363.672271470467;9388.67139650109;9405.482698451515;16450;16548.669026619402;17371.478855634352;17373.7393939091;17400.21699023547;7772.611369431505;7846.136924938252;7946.801329966797;7962.442629016029;7988.720394786154;990.5839547389969;1006.1950439648252;1021.642425151206;1061.1987949098382;1098.2531878322657;26636.8668156658;26833;27190.864045679646;27882.721172788417;27918.162455126378;925.8240934222611;946.668665966906;996.1831298335441;1024.636254129788;1038.4236748604446;12338.691532711755;12695.68260793469;12809.615711528482;12841.935790321175;12937.223766574036;270124;274947;278040;278701;278767;45042.77478612586;45195.32207016897;45274.320885186746;45534;45587.54412455899;1274.4647248155798;1281.301690578637;1287.7939529675393;1293.7477191947855;1310.4037662863375;20235.089420975797;22846.31461056171;24281.39296517601;24784.50430991334;25310.74689253084;41456.58543414648;41679.58320416878;42364.576354236066;42375;42550.57449425466;218210;224424;224651;227060;229180;22688.319350419515;28070.157895263175;28305.71694283031;28432.85783571069;28520.429591408472;34087;37091;37226;37560.2487950234;37631.62368376281;29322.56016159717;29816;31666.500149865307;31784.36431271408;33038.66961330356;31730.20674483064;32183;32195;32298;32321;40276.79861600673;40644.1871162581;41614.37578436387;41670.1665966685;41777;32504.34991300208;33524.49713254352;33834.49248261229;34968.30063398667;35776;28160.43679126365;28196;28298.009569664962;28328.575071373532;28688 16:40:49 INFO - 2015-10-22 16:40:49,058 DEBUG : BROWSER_OUTPUT: |2;jquery.html;328.6220846027069;350.56004714083826;350.8017969847038;351.4026155535589;352.46777366177065;13305.733885322288;13731.519396821113;15101.169435681033;15225.619359516004;16057.277422515986;11832.585859494919;15047.699046019101;15121.395144194246;15347.76978345323;15382.307796149173;5072.087024335628;5177.611679124062;5186.5850731941355;5188.92216616751;5217.2695822584865;3790.3177428062936;3908.863189788358;5081.79672813087;5106.412762532319;5107.948920510785;5612.494875461208;5780.710964451781;5792.884142317151;5794.536437085023;5798.536117110621;5607.99999999998;5748.48263656273;5751.511121554673;5764.625299355549;5769.451902069297;4983.501649835024;5008.974955125237;5009.323741294915;5018.523240292203;5026.673266237683;18920.810791892043;19378.90310548452;19396.806031939643;19726.21095156192;19791.90104049485;1920.8559358048203;1995.6108558831033;2003.0685731135093;2023.3424137155337;2069.3584988653565;12324;12355;12398.256104633661;12402.56591019319;12770.48918043277;1727.9654406911918;1785.9107044647847;1825.5527395787983;1826.4064179141833;1869.130854152812;49723.50276497225;50753.492465075615;50781.746091269306;50886.491135088916;51415;8721.694740684172;8728.563571821383;8875.825422771333;8891;8914.777130571787;11380.317180969003;11533.653990380302;11589.710257243636;11619.128565357463;11687.590934317259;6634.0712300278;6649.135612370457;6692.86614267712;6782.118324617768;6833.897491537631;6222.377762223741;6373.968130159319;6401.199850018747;6405.263394709668;6411.807645770635;5485.533729633026;5503.449655034465;5544.584156188302;5562.972185139049;5576.86057848557;1638.4920674590676;1680.411855850467;1699.2098674116596;1703.6763015027104;1710.4954038558656;850.1371108325055;900.8243392538392;983.1643103362085;1064.893510648929;1073.6188653028219;15508.92245538765;15832.841671583137;15832.92083539598;16111.194440277939;16175.595610109605;778.8909552662632;823.6211342782267;870.9912900871037;897.9102089790969;910.7586489580267;6871.415929646036;9167.724968250963;9169;9196.724098277062;9383.483908385104;297040;301074;382420.9005514059;405177;415827;54428.727856361256;54629.726851366286;56273.15590266149;56549.99999999918;57119;436.9868903932887;444.66872180225937;447.93952816369375;448.6567775651629;448.8114991703427;9234.538273086453;9290.535473226448;9398.624055037995;9549.331546791658;9765.804683906425;29301.706982929896;29492.262693432836;30194.84902575473;30608;30737.692623073483;39416.40875386929;39466;39639.603603963595;40264.396034058926;40518.18963620652;5726.885462290647;5777.364489906191;5801.129830525455;5803.12953057028;5803.47768700802;10694.770101438435;10724.195685323475;10901.890981090088;10903.890961090288;10909.618163364245;8883;9028.253274891109;9105.226055785333;9117.225035872025;9181.311401644769;9281.39670921388;9327.440353578808;9407.717768466684;9413.623455061721;9617.71146865595;8721.171488708562;9114.13415725505;9159.954200228956;9281.350305478552;9289.814203716023;5667.943320566907;5684.431556844283;5722.656640601577;5725.19847221381;5742.913856292075;9080.909190908007;9172.2203612691;9309.906900931175;9368.531573421438;9471.857922131036 16:40:49 INFO - 2015-10-22 16:40:49,059 DEBUG : BROWSER_OUTPUT: |3;mootools.html;1273.0070544974924;1379.2138481065792;1530.2425299476756;1550.9922450387746;1725.163295801536;7519.774406767799;8241.423100382975;8384.203500667441;8504.532250726208;8538.14618538145;8141.959290203556;8197.590120493982;8221.83556328873;8230.753077407673;8254.711085112021;1848.593309471914;1898.7531620889265;2102.55846272283;2117.6188286108454;2135.5195081106704;2090.4146838885135;2135.412761490587;2144.5603651251454;2144.860584062039;2146.495573540217;2069.751629804418;2094.3716884934533;2123.5646692428013;2124.62819006674;2126.2345555599973;1844.6679597672414;1878.5303674081479;2180.967285490719;2190.759016508183;2203.6253836847773;2158.201465457775;2162.1999860051883;2171.9348419547437;2196.758356580775;2205.6470964645578;8359.874601880916;8406.159384061544;8423.15768423159;8454.154584541559;8457.703980360719;4624.606908412789;4668.5564871337165;4716.551927566876;4725.149473094842;4726.905461890778;2875.151830210093;2882.26502241927;2918.8540572971265;2918.868650910714;2980.567817666448;828.4283844147519;847.0639942863171;847.4576271186446;851.3402113362132;852.4544291653347;12176.51293948241;12192.878071219264;12277.38613069352;12335.259884406963;12371.566995155126;4138.772367519815;4183.707140500136;4239.788010599457;4241.448611680462;4334.349847522897;10445.164386849186;10532.420716860646;10546.41994690284;10561.207909406672;10590.046895779416;4692.8412930052555;4708.9058218835435;4723.811047558059;4760.166970780169;4763.476017638057;4194.098268872207;4219.556946520633;4259.403683484315;4269.87190384289;4273.615374616299;3597.6582224688614;3599.6940260078186;3611.6749492545796;3626.3653860574295;3668.486411902336;1152.7694461107812;1175.2713317742882;1183.408295852074;1184.4196343791652;1188.0376894715137;1264.1846009323936;1277.584784944878;1282.6472720001887;1302.2381906584565;1306.8170456135958;7989.3209077229085;8123.065847427503;8129.512229266263;8139.1453897339925;8169.795755106051;438.9363542286351;446.8369045298443;452.39605127155613;453.21141214286905;454.08501868734527;6155.876882462326;6162.876742465126;6165.907511387333;6186.288576813724;6187.752489900444;9993;10046.648367307109;10306.742331441774;10318.845217321747;10324.225683073799;10148.797024059477;10171.593136274467;10254.92323306057;10255.128314093236;10294.845577316346;7313.268673132644;7646.4265180111715;7669.118051424046;7690.538567685957;7692.7692169235015;7414.777556673308;7468.141163766019;7501;7518.097828260644;7530.171681114964;8086.636101375335;8725.432846864933;8795.604197810986;8822.426542274732;8872.866906996529;8489.151084891708;8502.957485212535;8539.402241843012;8550.9311336083;8834.911650883409;7505.812354691177;7642.388608911385;7662.923370766221;7668.309852113337;7673.34776544;8091.06952700447;8115.188481151838;8242.876356854771;8244.299234564889;8280;7523.924760752322;7526.365771979763;7654.923450765421;7667.501612395176;7804.609769511389;6415.390537898892;7313.451491138292;7346.816329591803;7405.740799072007;7526.698932042657;7402.25977402277;7450.36671882896;7458.47790654649;7615.885761713689;7617.809554761176;6658.3674550917585;6818.488613353919;6823.931760682528;6824.624645644537;6829.2487826338065;6569.770058047945;6591.176102987127;6602.40578347951;6639.103720997604;6681.365270299314 16:40:49 INFO - 2015-10-22 16:40:49,138 DEBUG : BROWSER_OUTPUT: |4;prototype.html;301.7359810166105;308.2617131968934;308.9289463423414;311.5093727379377;312.1571756258102;5109.131447653898;5110.259012443203;5111.821086261982;5112.642115051948;5125.282460455539;5042.369703787027;5050.393952725669;5060.240963855424;5067.670601410906;5070.264811602316;3990.0423898264426;3996.700247481436;4001.1397549526846;4001.9594905324534;4006.61937115975;3836.405357169629;3892.610738926113;3978.9602103978877;4003.579624139467;4008.238434697398;3808.1622043150464;3865.4781604483314;3926.5680775114715;3935.940960885589;3945.842166313344;3895.376739721631;3919.9612102792785;3921.3529767588316;3923.293807114718;3928.3714605663245;3373.527706121145;3398.3203359327986;3411.5906091268957;3478.565179352581;3480.617132115465;4910.803567857281;4946.035523073002;4967.627427942883;4970.055689418999;4979.800807967713;4409.757463339515;4454.7549884756645;4458.420405347284;4466.0398014427055;4469.30725737508;5200.8179713710215;5202.08963431398;5250.7112108834;5253.290805741214;5253.4221235664045;3517.736169787276;3607.981960090209;3729.8881033569037;3734.439834024891;3735.9813200934095;5420.945790542123;5504.339479262474;5510.6969116698565;5516.227728118067;5521.171824226358;3685.8341374638208;3811.0472381904524;3826.6364695353896;3828;3830.138218900781;3693.261347730465;3766.0584853786554;3781.0736369589076;3849.1531862990096;3853.460515527828;4349.934750978738;4373.322135069069;4377.277749171415;4381.737095774264;4382.320740285197;5154.175331946871;5194.740262986836;5197.896042079137;5198.948010519846;5201.323827902348;1362.461827578101;1387.3964825301027;1387.6322774464775;1387.6461502317047;1387.9167249965035;916.679162293192;934.3039435620507;938.010399029031;955.6511873166244;957.4590356448584;4999.700017998932;5043.394792624835;5047.015831912815;5047.066292735855;5055.9241611375855;5432.049391356497;5436.864078397993;5447.400785913546;5447.863803404867;5448.182772584144;4989.151844186497;5035.571976382049;5042.319286896295;5045.621578381636;5046.26829109777;2920.7225313595172;2962.86667099981;2987.193457766391;2988.2230620038945;2995.355998460298;5425.945740542623;5439.673619582759;5461.044317244546;5462.235287059815;5473.7263136843;5542.0301447246575;5549.306336707911;5553.028220061473;5556.749946252428;5562.916556251659;5412.107002344726;5449.373322068013;5452.618316717871;5456.317960254968;5456.91814622781;5258.868528286824;5353.571714262927;5354.196870469305;5359.330083739533;5390.892182156256;5201.531862132275;5224.477552244745;5232.1628539433505;5232.215167724872;5233;5360.115580929103;5364.597655175799;5377.193420986727;5381.542568881532;5389.973050134724;3767.2277183176834;3790.507234059555;3791.2986097570933;3792.146766977408;3795.2409518095938;5246.790128394821;5294.576433885357;5297.788088476418;5363.222332761806;5435.429279925551;5193.298904647824;5196.896062078813;5215.713135777417;5234.685918844882;5256.159014557652;5230.660007099526;5277.604179686616;5279.313689220377;5286.603504737083;5295.152775556046;5154.201098829687;5188.299579556862;5200.609954253522;5211.921821172761;5224.190250511177;5188.0661480933795;5272.736363181903;5298.3906850712665;5362.785488580413;5367.731613419235;5293;5296.629235953446;5301.363836339664;5302.9469705304;5305.098133317269 16:40:49 INFO - 2015-10-22 16:40:49,138 DEBUG : BROWSER_OUTPUT: |5;yui.html;827.6234313387409;831.8419500294943;837.1921096142225;851.8424091543066;866.4281574161055;11588.188826782129;11846.407679616028;11857.05143588513;11861.229020113697;11871.109666774983;10982.395968221745;11049.779004419906;11066.889331106686;11114.22200445969;11123.72190695233;642.6208536963203;651.0689713709394;808.7169490678245;827.9254867061993;827.9337652987747;819.5328662662284;822.2065706593137;826.6197549127409;826.7354446577068;831.8627426474625;691.0256538281025;860.789106668867;863.6674880171116;870.5342641686699;872.5331947408138;692.6709812838886;852.2798235491;866.8786369908217;867.1935100356666;867.4318321499428;643.6427782580666;644.6808829629316;645.106527459472;645.177398816508;645.5513418174371;10710.839337409945;10745.462726863703;10785.298955567863;10891.564337426493;10916.235863489559;9385.906140938572;9713.36863103896;9773.51132443382;9884.209263258923;10009.549570269355;8285.95857020711;8377.287930525912;8543.316534677211;8660.17728315809;8709.477431354077;3227.5320078588707;3269.525918741793;3280.8195549244783;3287.523309120188;3302.4550949093373;29541.261468463246;29740.8512957436;29807.701922980927;29829.552556711882;29865.25336866596;8368.456050356708;8437.873431898526;8448.112948140357;8498.617562209716;8504.574771261412;13640.249786261851;13775.655608609664;13836;13839.238841863795;13912.37394317258;6245.968770156211;6390.840228994312;6478.546501744927;6507.642079685663;6533.673316334164;3715.108373990277;3776.754510956779;3792.1657235408165;3797.5442946846;3809.0286976820735;2531.7088534818363;2540.64430979663;2561.4364839735226;2562.1160699558623;2565.807564432675;392.4270564975111;395.4621714468321;403.141309011803;403.800118941126;408.0899593905548;418.688077382346;450.3672340361797;454.3888470007834;461.4001797663025;525.1204232909861;6297.433231009231;6503.577267477694;6634.369734875179;6688.498362622726;6725.529212955046;434.5697759218351;561.4750208555014;612.6752821004875;626.5426238845577;634.1534052040486;3100.4574199514996;3255.3489302139665;3273.7544684148784;3376.9438658014537;3580.946285805715;35710.64289357073;35772.46341304883;35927.281454370765;35937.281254374764;35983.28033439369;29940.401191976038;30158;30172.24569385783;30221;30225.697743022287;29614.259643509085;30156.54765178524;30199.245018874266;30209;30224.69775302263;6470.385313395408;6717.664116794043;6802.863942721019;6852.246252912275;6919.515633905578;20352.59294814125;20586.558940873994;20907.686384704546;21344.78655213428;21510;27431.725682742916;27650.446991059664;27743.30641733973;29723;29813.10560683183;6497.772577959749;6562.475001999924;6606.174228221473;6667.699953502201;6758.831029224309;9816.607335706492;9959.103680668775;10130.949345253226;10199.898001020192;10376.066154046172;8758.12418758119;8873.467591944504;9064.592093355683;9108.225800807006;9157.084291570789;8945.686900958695;9195.356325057182;9225.72322830316;9381.108794664497;9426.670066547638;7275.527090739085;8373.204545568162;8911.777205569913;8942.552872356486;9097.545122743968;7877.330426913776;8022;8042.477238979448;8057.959710201646;8295.336373090258;7556.924430755842;7783.610819459118;7987.16134805837;8030.678772849021;8094.473859199134 16:40:49 INFO - 2015-10-22 16:40:49,140 DEBUG : BROWSER_OUTPUT: __end_tp_report 16:40:49 INFO - 2015-10-22 16:40:49,140 DEBUG : BROWSER_OUTPUT: __start_cc_report 16:40:49 INFO - 2015-10-22 16:40:49,140 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_cycle_collect,869 16:40:49 INFO - 2015-10-22 16:40:49,140 DEBUG : BROWSER_OUTPUT: __end_cc_report 16:40:49 INFO - 2015-10-22 16:40:49,140 DEBUG : BROWSER_OUTPUT: __startTimestamp1445557249051__endTimestamp 16:40:49 INFO - 2015-10-22 16:40:49,140 DEBUG : BROWSER_OUTPUT: 16:40:49 INFO - 2015-10-22 16:40:49,141 DEBUG : BROWSER_OUTPUT: ------- Summary: start ------- 16:40:49 INFO - 2015-10-22 16:40:49,141 DEBUG : BROWSER_OUTPUT: Number of tests: 6 16:40:49 INFO - 2015-10-22 16:40:49,141 DEBUG : BROWSER_OUTPUT: 16:40:49 INFO - 2015-10-22 16:40:49,141 DEBUG : BROWSER_OUTPUT: [#0] dojo.html Cycles:165 Average:4658.25 Median:4869.00 stddev:583.16 (12.0%) stddev-sans-first:562.76 16:40:49 INFO - 2015-10-22 16:40:49,141 DEBUG : BROWSER_OUTPUT: Values: 2627.1 2675.7 2699.6 2700.8 2718.8 4833.6 4859.9 4863.6 4867.2 4925.4 4865.1 4867.4 4869.0 4884.4 4936.6 4217.7 4340.9 4433.3 4436.6 4438.9 4308.6 4314.2 4383.7 4384.6 4435.6 4363.7 4376.5 4389.2 4413.8 4425.7 4209.9 4262.0 4328.0 4389.0 4450.7 4290.0 4308.6 4323.2 4363.1 4411.8 4736.4 4742.5 4758.5 4789.3 4801.9 4864.4 5025.2 5053.6 5056.3 5079.8 4930.3 4951.4 5018.6 5021.4 5049.1 4722.7 4733.4 4736.7 4737.0 4791.1 4980.3 5164.5 5184.5 5192.9 5196.9 4898.2 4957.6 4976.6 4984.1 5026.7 5092.6 5093.6 5097.8 5098.7 5102.0 4739.1 5014.1 5030.7 5040.7 5048.7 4795.6 4863.8 4923.1 4965.5 4981.3 3351.8 3355.9 3362.1 3376.9 3400.0 2995.6 3085.9 3112.8 3132.4 3139.1 4611.9 4644.0 4657.2 4699.8 4729.2 5069.0 5077.9 5082.6 5090.0 5140.5 4569.7 4652.4 4694.4 4700.5 4757.8 4109.5 4151.3 4151.4 4172.0 4202.0 5089.2 5110.8 5111.6 5126.8 5174.7 4858.6 5096.8 5100.9 5101.6 5144.8 4987.8 5048.2 5058.2 5075.2 5095.7 4931.7 4938.5 5013.5 5017.3 5050.1 4829.4 5001.8 5012.2 5043.5 5045.0 4828.5 4852.1 4922.2 4927.0 4951.1 4923.5 4967.1 4975.9 4991.7 4992.4 4673.9 4916.7 4924.0 4939.7 4959.7 4850.7 4963.4 4969.7 4982.7 5004.1 4716.5 4926.4 4933.7 4950.5 4986.1 16:40:49 INFO - 2015-10-22 16:40:49,141 DEBUG : BROWSER_OUTPUT: 16:40:49 INFO - 2015-10-22 16:40:49,141 DEBUG : BROWSER_OUTPUT: [#1] ext.html Cycles:180 Average:40168.46 Median:17379.53 stddev:63093.24 (363.0%) stddev-sans-first:63200.11 16:40:49 INFO - 2015-10-22 16:40:49,141 DEBUG : BROWSER_OUTPUT: Values: 551.0 552.8 564.3 567.4 570.0 28668.6 29021.0 29048.4 35985.3 36387.0 39337.8 39726.0 39814.0 39818.0 40102.8 7860.8 7942.6 8001.9 8007.6 8007.7 7647.8 7826.0 8429.4 10312.4 10558.6 9918.9 9960.0 9961.2 10019.4 10038.2 7549.7 10054.9 10115.8 10155.2 10160.7 7457.7 10067.5 10184.2 10276.5 10283.6 36981.4 37561.4 37587.6 37639.8 37727.6 3037.3 3072.1 3092.6 3176.3 3559.1 27563.6 27830.3 27952.9 28150.6 28446.4 2663.8 2675.2 2708.4 2735.9 2805.6 222543.0 223033.0 223729.0 223845.1 224352.0 44584.3 45184.5 52821.5 53136.5 53356.2 49430.8 49717.3 49786.3 49811.0 49926.3 12992.0 13095.9 13142.5 13193.8 13223.7 9271.0 9353.0 9363.7 9388.7 9405.5 16450.0 16548.7 17371.5 17373.7 17400.2 7772.6 7846.1 7946.8 7962.4 7988.7 990.6 1006.2 1021.6 1061.2 1098.3 26636.9 26833.0 27190.9 27882.7 27918.2 925.8 946.7 996.2 1024.6 1038.4 12338.7 12695.7 12809.6 12841.9 12937.2 270124.0 274947.0 278040.0 278701.0 278767.0 45042.8 45195.3 45274.3 45534.0 45587.5 1274.5 1281.3 1287.8 1293.7 1310.4 20235.1 22846.3 24281.4 24784.5 25310.7 41456.6 41679.6 42364.6 42375.0 42550.6 218210.0 224424.0 224651.0 227060.0 229180.0 22688.3 28070.2 28305.7 28432.9 28520.4 34087.0 37091.0 37226.0 37560.2 37631.6 29322.6 29816.0 31666.5 31784.4 33038.7 31730.2 32183.0 32195.0 32298.0 32321.0 40276.8 40644.2 41614.4 41670.2 41777.0 32504.3 33524.5 33834.5 34968.3 35776.0 28160.4 28196.0 28298.0 28328.6 28688.0 16:40:49 INFO - 2015-10-22 16:40:49,141 DEBUG : BROWSER_OUTPUT: 16:40:49 INFO - 2015-10-22 16:40:49,141 DEBUG : BROWSER_OUTPUT: [#2] jquery.html Cycles:180 Average:21237.17 Median:5107.18 stddev:59506.78 (1165.2%) stddev-sans-first:59653.00 16:40:49 INFO - 2015-10-22 16:40:49,141 DEBUG : BROWSER_OUTPUT: Values: 328.6 350.6 350.8 351.4 352.5 13305.7 13731.5 15101.2 15225.6 16057.3 11832.6 15047.7 15121.4 15347.8 15382.3 5072.1 5177.6 5186.6 5188.9 5217.3 3790.3 3908.9 5081.8 5106.4 5107.9 5612.5 5780.7 5792.9 5794.5 5798.5 5608.0 5748.5 5751.5 5764.6 5769.5 4983.5 5009.0 5009.3 5018.5 5026.7 18920.8 19378.9 19396.8 19726.2 19791.9 1920.9 1995.6 2003.1 2023.3 2069.4 12324.0 12355.0 12398.3 12402.6 12770.5 1728.0 1785.9 1825.6 1826.4 1869.1 49723.5 50753.5 50781.7 50886.5 51415.0 8721.7 8728.6 8875.8 8891.0 8914.8 11380.3 11533.7 11589.7 11619.1 11687.6 6634.1 6649.1 6692.9 6782.1 6833.9 6222.4 6374.0 6401.2 6405.3 6411.8 5485.5 5503.4 5544.6 5563.0 5576.9 1638.5 1680.4 1699.2 1703.7 1710.5 850.1 900.8 983.2 1064.9 1073.6 15508.9 15832.8 15832.9 16111.2 16175.6 778.9 823.6 871.0 897.9 910.8 6871.4 9167.7 9169.0 9196.7 9383.5 297040.0 301074.0 382420.9 405177.0 415827.0 54428.7 54629.7 56273.2 56550.0 57119.0 437.0 444.7 447.9 448.7 448.8 9234.5 9290.5 9398.6 9549.3 9765.8 29301.7 29492.3 30194.8 30608.0 30737.7 39416.4 39466.0 39639.6 40264.4 40518.2 5726.9 5777.4 5801.1 5803.1 5803.5 10694.8 10724.2 10901.9 10903.9 10909.6 8883.0 9028.3 9105.2 9117.2 9181.3 9281.4 9327.4 9407.7 9413.6 9617.7 8721.2 9114.1 9160.0 9281.4 9289.8 5667.9 5684.4 5722.7 5725.2 5742.9 9080.9 9172.2 9309.9 9368.5 9471.9 16:40:49 INFO - 2015-10-22 16:40:49,144 DEBUG : BROWSER_OUTPUT: 16:40:49 INFO - 2015-10-22 16:40:49,144 DEBUG : BROWSER_OUTPUT: [#3] mootools.html Cycles:180 Average:5735.21 Median:4726.03 stddev:3219.32 (68.1%) stddev-sans-first:3210.88 16:40:49 INFO - 2015-10-22 16:40:49,144 DEBUG : BROWSER_OUTPUT: Values: 1273.0 1379.2 1530.2 1551.0 1725.2 7519.8 8241.4 8384.2 8504.5 8538.1 8142.0 8197.6 8221.8 8230.8 8254.7 1848.6 1898.8 2102.6 2117.6 2135.5 2090.4 2135.4 2144.6 2144.9 2146.5 2069.8 2094.4 2123.6 2124.6 2126.2 1844.7 1878.5 2181.0 2190.8 2203.6 2158.2 2162.2 2171.9 2196.8 2205.6 8359.9 8406.2 8423.2 8454.2 8457.7 4624.6 4668.6 4716.6 4725.1 4726.9 2875.2 2882.3 2918.9 2918.9 2980.6 828.4 847.1 847.5 851.3 852.5 12176.5 12192.9 12277.4 12335.3 12371.6 4138.8 4183.7 4239.8 4241.4 4334.3 10445.2 10532.4 10546.4 10561.2 10590.0 4692.8 4708.9 4723.8 4760.2 4763.5 4194.1 4219.6 4259.4 4269.9 4273.6 3597.7 3599.7 3611.7 3626.4 3668.5 1152.8 1175.3 1183.4 1184.4 1188.0 1264.2 1277.6 1282.6 1302.2 1306.8 7989.3 8123.1 8129.5 8139.1 8169.8 438.9 446.8 452.4 453.2 454.1 6155.9 6162.9 6165.9 6186.3 6187.8 9993.0 10046.6 10306.7 10318.8 10324.2 10148.8 10171.6 10254.9 10255.1 10294.8 7313.3 7646.4 7669.1 7690.5 7692.8 7414.8 7468.1 7501.0 7518.1 7530.2 8086.6 8725.4 8795.6 8822.4 8872.9 8489.2 8503.0 8539.4 8550.9 8834.9 7505.8 7642.4 7662.9 7668.3 7673.3 8091.1 8115.2 8242.9 8244.3 8280.0 7523.9 7526.4 7654.9 7667.5 7804.6 6415.4 7313.5 7346.8 7405.7 7526.7 7402.3 7450.4 7458.5 7615.9 7617.8 6658.4 6818.5 6823.9 6824.6 6829.2 6569.8 6591.2 6602.4 6639.1 6681.4 16:40:49 INFO - 2015-10-22 16:40:49,144 DEBUG : BROWSER_OUTPUT: 16:40:49 INFO - 2015-10-22 16:40:49,144 DEBUG : BROWSER_OUTPUT: [#4] prototype.html Cycles:180 Average:4422.61 Median:5109.70 stddev:1290.15 (25.2%) stddev-sans-first:1256.14 16:40:49 INFO - 2015-10-22 16:40:49,145 DEBUG : BROWSER_OUTPUT: Values: 301.7 308.3 308.9 311.5 312.2 5109.1 5110.3 5111.8 5112.6 5125.3 5042.4 5050.4 5060.2 5067.7 5070.3 3990.0 3996.7 4001.1 4002.0 4006.6 3836.4 3892.6 3979.0 4003.6 4008.2 3808.2 3865.5 3926.6 3935.9 3945.8 3895.4 3920.0 3921.4 3923.3 3928.4 3373.5 3398.3 3411.6 3478.6 3480.6 4910.8 4946.0 4967.6 4970.1 4979.8 4409.8 4454.8 4458.4 4466.0 4469.3 5200.8 5202.1 5250.7 5253.3 5253.4 3517.7 3608.0 3729.9 3734.4 3736.0 5420.9 5504.3 5510.7 5516.2 5521.2 3685.8 3811.0 3826.6 3828.0 3830.1 3693.3 3766.1 3781.1 3849.2 3853.5 4349.9 4373.3 4377.3 4381.7 4382.3 5154.2 5194.7 5197.9 5198.9 5201.3 1362.5 1387.4 1387.6 1387.6 1387.9 916.7 934.3 938.0 955.7 957.5 4999.7 5043.4 5047.0 5047.1 5055.9 5432.0 5436.9 5447.4 5447.9 5448.2 4989.2 5035.6 5042.3 5045.6 5046.3 2920.7 2962.9 2987.2 2988.2 2995.4 5425.9 5439.7 5461.0 5462.2 5473.7 5542.0 5549.3 5553.0 5556.7 5562.9 5412.1 5449.4 5452.6 5456.3 5456.9 5258.9 5353.6 5354.2 5359.3 5390.9 5201.5 5224.5 5232.2 5232.2 5233.0 5360.1 5364.6 5377.2 5381.5 5390.0 3767.2 3790.5 3791.3 3792.1 3795.2 5246.8 5294.6 5297.8 5363.2 5435.4 5193.3 5196.9 5215.7 5234.7 5256.2 5230.7 5277.6 5279.3 5286.6 5295.2 5154.2 5188.3 5200.6 5211.9 5224.2 5188.1 5272.7 5298.4 5362.8 5367.7 5293.0 5296.6 5301.4 5302.9 5305.1 16:40:49 INFO - 2015-10-22 16:40:49,145 DEBUG : BROWSER_OUTPUT: 16:40:49 INFO - 2015-10-22 16:40:49,147 DEBUG : BROWSER_OUTPUT: [#5] yui.html Cycles:180 Average:9658.68 Median:3512.50 stddev:9709.88 (276.4%) stddev-sans-first:9714.47 16:40:49 INFO - 2015-10-22 16:40:49,147 DEBUG : BROWSER_OUTPUT: Values: 827.6 831.8 837.2 851.8 866.4 11588.2 11846.4 11857.1 11861.2 11871.1 10982.4 11049.8 11066.9 11114.2 11123.7 642.6 651.1 808.7 827.9 827.9 819.5 822.2 826.6 826.7 831.9 691.0 860.8 863.7 870.5 872.5 692.7 852.3 866.9 867.2 867.4 643.6 644.7 645.1 645.2 645.6 10710.8 10745.5 10785.3 10891.6 10916.2 9385.9 9713.4 9773.5 9884.2 10009.5 8286.0 8377.3 8543.3 8660.2 8709.5 3227.5 3269.5 3280.8 3287.5 3302.5 29541.3 29740.9 29807.7 29829.6 29865.3 8368.5 8437.9 8448.1 8498.6 8504.6 13640.2 13775.7 13836.0 13839.2 13912.4 6246.0 6390.8 6478.5 6507.6 6533.7 3715.1 3776.8 3792.2 3797.5 3809.0 2531.7 2540.6 2561.4 2562.1 2565.8 392.4 395.5 403.1 403.8 408.1 418.7 450.4 454.4 461.4 525.1 6297.4 6503.6 6634.4 6688.5 6725.5 434.6 561.5 612.7 626.5 634.2 3100.5 3255.3 3273.8 3376.9 3580.9 35710.6 35772.5 35927.3 35937.3 35983.3 29940.4 30158.0 30172.2 30221.0 30225.7 29614.3 30156.5 30199.2 30209.0 30224.7 6470.4 6717.7 6802.9 6852.2 6919.5 20352.6 20586.6 20907.7 21344.8 21510.0 27431.7 27650.4 27743.3 29723.0 29813.1 6497.8 6562.5 6606.2 6667.7 6758.8 9816.6 9959.1 10130.9 10199.9 10376.1 8758.1 8873.5 9064.6 9108.2 9157.1 8945.7 9195.4 9225.7 9381.1 9426.7 7275.5 8373.2 8911.8 8942.6 9097.5 7877.3 8022.0 8042.5 8058.0 8295.3 7556.9 7783.6 7987.2 8030.7 8094.5 16:40:49 INFO - 2015-10-22 16:40:49,148 DEBUG : BROWSER_OUTPUT: -------- Summary: end -------- 16:40:49 INFO - 2015-10-22 16:40:49,148 DEBUG : BROWSER_OUTPUT: 16:40:49 INFO - 2015-10-22 16:40:49,750 INFO : Browser exited with error code: 0 16:40:50 INFO - 2015-10-22 16:40:50,530 INFO : Completed test dromaeo_css (00:18:50) 16:40:50 INFO - 2015-10-22 16:40:50,530 INFO : Starting test kraken 16:40:50 INFO - 2015-10-22 16:40:50,530 DEBUG : operating with platform_type : w8_ 16:40:50 INFO - 2015-10-22 16:40:50,530 INFO : Initialising browser for kraken test... 16:40:50 INFO - 2015-10-22 16:40:50,551 DEBUG : command line: C:\slave\test\build\application\firefox\firefox -profile c:\users\cltbld~1.t-w\appdata\local\temp\tmprcsi1q\profile http://localhost:49238/getInfo.html 16:40:56 INFO - 2015-10-22 16:40:56,068 DEBUG : BROWSER_OUTPUT: __metrics Screen width/height:1600/1200 16:40:56 INFO - 2015-10-22 16:40:56,068 DEBUG : BROWSER_OUTPUT: colorDepth:24 16:40:56 INFO - 2015-10-22 16:40:56,068 DEBUG : BROWSER_OUTPUT: Browser inner width/height: 1010/674 16:40:56 INFO - 2015-10-22 16:40:56,068 DEBUG : BROWSER_OUTPUT: __metrics 16:40:56 INFO - 2015-10-22 16:40:56,187 DEBUG : BROWSER_OUTPUT: JavaScript error: resource:///modules/WebappManager.jsm, line 48: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 16:40:57 INFO - 2015-10-22 16:40:57,183 DEBUG : BROWSER_OUTPUT: console.error: 16:40:57 INFO - 2015-10-22 16:40:57,183 DEBUG : BROWSER_OUTPUT: Message: [Exception... "Component returned failure code: 0x80040111 (NS_ERROR_NOT_AVAILABLE) [mozIStorageAsyncStatement.executeAsync]" nsresult: "0x80040111 (NS_ERROR_NOT_AVAILABLE)" location: "JS frame :: resource://gre/modules/Sqlite.jsm :: ConnectionData.prototype<._executeStatement :: line 758" data: no] 16:40:57 INFO - 2015-10-22 16:40:57,183 DEBUG : BROWSER_OUTPUT: Stack: 16:40:57 INFO - 2015-10-22 16:40:57,183 DEBUG : BROWSER_OUTPUT: ConnectionData.prototype<._executeStatement@resource://gre/modules/Sqlite.jsm:758:19 16:40:57 INFO - 2015-10-22 16:40:57,183 DEBUG : BROWSER_OUTPUT: ConnectionData.prototype<.executeCached/<@resource://gre/modules/Sqlite.jsm:493:9 16:40:57 INFO - 2015-10-22 16:40:57,183 DEBUG : BROWSER_OUTPUT: ConnectionData.prototype<.executeCached@resource://gre/modules/Sqlite.jsm:491:1 16:40:57 INFO - 2015-10-22 16:40:57,183 DEBUG : BROWSER_OUTPUT: ConnectionData.prototype<.executeBeforeShutdown/loggedDb<.executeCached.value<@resource://gre/modules/Sqlite.jsm:368:51 16:40:57 INFO - 2015-10-22 16:40:57,183 DEBUG : BROWSER_OUTPUT: TaskImpl_run@resource://gre/modules/Task.jsm:314:40 16:40:57 INFO - 2015-10-22 16:40:57,183 DEBUG : BROWSER_OUTPUT: TaskImpl@resource://gre/modules/Task.jsm:275:3 16:40:57 INFO - 2015-10-22 16:40:57,183 DEBUG : BROWSER_OUTPUT: createAsyncFunction/asyncFunction@resource://gre/modules/Task.jsm:249:14 16:40:57 INFO - 2015-10-22 16:40:57,183 DEBUG : BROWSER_OUTPUT: setAncestorsLastModified<@resource://gre/modules/Bookmarks.jsm:1347:9 16:40:57 INFO - 2015-10-22 16:40:57,183 DEBUG : BROWSER_OUTPUT: TaskImpl_run@resource://gre/modules/Task.jsm:314:40 16:40:57 INFO - 2015-10-22 16:40:57,183 DEBUG : BROWSER_OUTPUT: TaskImpl@resource://gre/modules/Task.jsm:275:3 16:40:57 INFO - 2015-10-22 16:40:57,184 DEBUG : BROWSER_OUTPUT: createAsyncFunction/asyncFunction@resource://gre/modules/Task.jsm:249:14 16:40:57 INFO - 2015-10-22 16:40:57,184 DEBUG : BROWSER_OUTPUT: transaction@resource://gre/modules/Bookmarks.jsm:808:13 16:40:57 INFO - 2015-10-22 16:40:57,184 DEBUG : BROWSER_OUTPUT: TaskImpl_run@resource://gre/modules/Task.jsm:314:40 16:40:57 INFO - 2015-10-22 16:40:57,184 DEBUG : BROWSER_OUTPUT: Handler.prototype.process@resource://gre/modules/Promise.jsm -> resource://gre/modules/Promise-backend.js:934:23 16:40:57 INFO - 2015-10-22 16:40:57,184 DEBUG : BROWSER_OUTPUT: this.PromiseWalker.walkerLoop@resource://gre/modules/Promise.jsm -> resource://gre/modules/Promise-backend.js:813:7 16:40:57 INFO - 2015-10-22 16:40:57,184 DEBUG : BROWSER_OUTPUT: Promise*this.PromiseWalker.scheduleWalkerLoop@resource://gre/modules/Promise.jsm -> resource://gre/modules/Promise-backend.js:744:11 16:40:57 INFO - 2015-10-22 16:40:57,184 DEBUG : BROWSER_OUTPUT: this.PromiseWalker.schedulePromise@resource://gre/modules/Promise.jsm -> resource://gre/modules/Promise-backend.js:776:7 16:40:57 INFO - 2015-10-22 16:40:57,184 DEBUG : BROWSER_OUTPUT: this.PromiseWalker.completePromise@resource://gre/modules/Promise.jsm -> resource://gre/modules/Promise-backend.js:711:7 16:40:57 INFO - 2015-10-22 16:40:57,184 DEBUG : BROWSER_OUTPUT: TaskImpl_run@resource://gre/modules/Task.jsm:319:13 16:40:57 INFO - 2015-10-22 16:40:57,184 DEBUG : BROWSER_OUTPUT: Spinner.prototype.observe@resource://gre/modules/AsyncShutdown.jsm:523:9 16:40:57 INFO - 2015-10-22 16:40:57,184 DEBUG : BROWSER_OUTPUT: 16:40:57 INFO - 2015-10-22 16:40:57,881 INFO : Browser initialized. 16:40:57 INFO - 2015-10-22 16:40:57,881 INFO : Running cycle 1/1 for kraken test... 16:40:57 INFO - 2015-10-22 16:40:57,881 DEBUG : command line: C:\slave\test\build\application\firefox\firefox -profile c:\users\cltbld~1.t-w\appdata\local\temp\tmprcsi1q\profile -tp file:\C:\slave\test\build\tests\talos\talos\tests\kraken\kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1 16:41:09 INFO - 2015-10-22 16:41:09,450 DEBUG : BROWSER_OUTPUT: RSS: Main: 202821632 16:41:09 INFO - 2015-10-22 16:41:09,450 DEBUG : BROWSER_OUTPUT: 16:41:12 INFO - 2015-10-22 16:41:12,176 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49238/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:49238/tests/kraken/driver.html?testName=audio-beat-detection) 16:41:12 INFO - 2015-10-22 16:41:12,763 DEBUG : BROWSER_OUTPUT: RSS: Main: 238579712 16:41:12 INFO - 2015-10-22 16:41:12,763 DEBUG : BROWSER_OUTPUT: 16:41:15 INFO - 2015-10-22 16:41:15,460 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49238/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:49238/tests/kraken/driver.html?testName=audio-dft) 16:41:16 INFO - 2015-10-22 16:41:16,032 DEBUG : BROWSER_OUTPUT: RSS: Main: 237281280 16:41:16 INFO - 2015-10-22 16:41:16,032 DEBUG : BROWSER_OUTPUT: 16:41:18 INFO - 2015-10-22 16:41:18,750 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49238/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:49238/tests/kraken/driver.html?testName=audio-fft) 16:41:19 INFO - 2015-10-22 16:41:19,322 DEBUG : BROWSER_OUTPUT: RSS: Main: 224145408 16:41:19 INFO - 2015-10-22 16:41:19,322 DEBUG : BROWSER_OUTPUT: 16:41:21 INFO - 2015-10-22 16:41:21,335 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49238/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:49238/tests/kraken/driver.html?testName=audio-oscillator) 16:41:21 INFO - 2015-10-22 16:41:21,917 DEBUG : BROWSER_OUTPUT: RSS: Main: 226197504 16:41:21 INFO - 2015-10-22 16:41:21,917 DEBUG : BROWSER_OUTPUT: 16:41:24 INFO - 2015-10-22 16:41:24,138 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49238/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:49238/tests/kraken/driver.html?testName=imaging-gaussian-blur) 16:41:24 INFO - 2015-10-22 16:41:24,703 DEBUG : BROWSER_OUTPUT: RSS: Main: 222965760 16:41:24 INFO - 2015-10-22 16:41:24,703 DEBUG : BROWSER_OUTPUT: 16:41:27 INFO - 2015-10-22 16:41:27,740 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49238/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:49238/tests/kraken/driver.html?testName=imaging-darkroom) 16:41:28 INFO - 2015-10-22 16:41:28,319 DEBUG : BROWSER_OUTPUT: RSS: Main: 215187456 16:41:28 INFO - 2015-10-22 16:41:28,319 DEBUG : BROWSER_OUTPUT: 16:41:31 INFO - 2015-10-22 16:41:31,707 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49238/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:49238/tests/kraken/driver.html?testName=imaging-desaturate) 16:41:32 INFO - 2015-10-22 16:41:32,280 DEBUG : BROWSER_OUTPUT: RSS: Main: 212041728 16:41:32 INFO - 2015-10-22 16:41:32,280 DEBUG : BROWSER_OUTPUT: 16:41:35 INFO - 2015-10-22 16:41:35,223 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49238/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:49238/tests/kraken/driver.html?testName=json-parse-financial) 16:41:35 INFO - 2015-10-22 16:41:35,806 DEBUG : BROWSER_OUTPUT: RSS: Main: 212332544 16:41:35 INFO - 2015-10-22 16:41:35,806 DEBUG : BROWSER_OUTPUT: 16:41:37 INFO - 2015-10-22 16:41:37,555 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49238/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:49238/tests/kraken/driver.html?testName=json-stringify-tinderbox) 16:41:38 INFO - 2015-10-22 16:41:38,121 DEBUG : BROWSER_OUTPUT: RSS: Main: 240828416 16:41:38 INFO - 2015-10-22 16:41:38,121 DEBUG : BROWSER_OUTPUT: 16:41:40 INFO - 2015-10-22 16:41:40,006 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49238/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:49238/tests/kraken/driver.html?testName=stanford-crypto-aes) 16:41:40 INFO - 2015-10-22 16:41:40,588 DEBUG : BROWSER_OUTPUT: RSS: Main: 246317056 16:41:40 INFO - 2015-10-22 16:41:40,588 DEBUG : BROWSER_OUTPUT: 16:41:42 INFO - 2015-10-22 16:41:42,895 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49238/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:49238/tests/kraken/driver.html?testName=stanford-crypto-ccm) 16:41:43 INFO - 2015-10-22 16:41:43,477 DEBUG : BROWSER_OUTPUT: RSS: Main: 231686144 16:41:43 INFO - 2015-10-22 16:41:43,477 DEBUG : BROWSER_OUTPUT: 16:41:46 INFO - 2015-10-22 16:41:46,061 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49238/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:49238/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 16:41:46 INFO - 2015-10-22 16:41:46,648 DEBUG : BROWSER_OUTPUT: RSS: Main: 233664512 16:41:46 INFO - 2015-10-22 16:41:46,648 DEBUG : BROWSER_OUTPUT: 16:41:49 INFO - 2015-10-22 16:41:49,404 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49238/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:49238/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 16:41:49 INFO - 2015-10-22 16:41:49,986 DEBUG : BROWSER_OUTPUT: RSS: Main: 234835968 16:41:49 INFO - 2015-10-22 16:41:49,986 DEBUG : BROWSER_OUTPUT: 16:41:51 INFO - 2015-10-22 16:41:51,809 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49238/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:49238/tests/kraken/driver.html?testName=ai-astar) 16:41:52 INFO - 2015-10-22 16:41:52,061 DEBUG : BROWSER_OUTPUT: RSS: Main: 289521664 16:41:52 INFO - 2015-10-22 16:41:52,061 DEBUG : BROWSER_OUTPUT: 16:41:52 INFO - 2015-10-22 16:41:52,062 DEBUG : BROWSER_OUTPUT: __start_tp_report 16:41:52 INFO - 2015-10-22 16:41:52,062 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load 16:41:52 INFO - 2015-10-22 16:41:52,062 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load_details 16:41:52 INFO - 2015-10-22 16:41:52,062 DEBUG : BROWSER_OUTPUT: |i|pagename|runs| 16:41:52 INFO - 2015-10-22 16:41:52,062 DEBUG : BROWSER_OUTPUT: |0;ai-astar;112;110;107;111;111;112;112;111;105;113 16:41:52 INFO - 2015-10-22 16:41:52,062 DEBUG : BROWSER_OUTPUT: |1;audio-beat-detection;138;130;147;158;134;137;137;130;159;131 16:41:52 INFO - 2015-10-22 16:41:52,062 DEBUG : BROWSER_OUTPUT: |2;audio-dft;141;141;141;151;140;141;141;143;140;140 16:41:52 INFO - 2015-10-22 16:41:52,062 DEBUG : BROWSER_OUTPUT: |3;audio-fft;69;71;70;91;76;71;70;71;103;69 16:41:52 INFO - 2015-10-22 16:41:52,062 DEBUG : BROWSER_OUTPUT: |4;audio-oscillator;92;92;112;92;91;92;119;92;91;120 16:41:52 INFO - 2015-10-22 16:41:52,062 DEBUG : BROWSER_OUTPUT: |5;imaging-gaussian-blur;111;110;111;111;111;111;111;110;111;110 16:41:52 INFO - 2015-10-22 16:41:52,062 DEBUG : BROWSER_OUTPUT: |6;imaging-darkroom;131;131;131;177;131;133;132;132;133;133 16:41:52 INFO - 2015-10-22 16:41:52,062 DEBUG : BROWSER_OUTPUT: |7;imaging-desaturate;97;96;97;96;96;121;97;96;96;97 16:41:52 INFO - 2015-10-22 16:41:52,062 DEBUG : BROWSER_OUTPUT: |8;json-parse-financial;70;71;70;70;71;69;70;83;70;69 16:41:52 INFO - 2015-10-22 16:41:52,062 DEBUG : BROWSER_OUTPUT: |9;json-stringify-tinderbox;68;68;68;68;67;68;67;68;68;68 16:41:52 INFO - 2015-10-22 16:41:52,062 DEBUG : BROWSER_OUTPUT: |10;stanford-crypto-aes;91;92;91;91;93;92;101;93;93;93 16:41:52 INFO - 2015-10-22 16:41:52,062 DEBUG : BROWSER_OUTPUT: |11;stanford-crypto-ccm;134;126;129;126;133;126;125;125;132;141 16:41:52 INFO - 2015-10-22 16:41:52,062 DEBUG : BROWSER_OUTPUT: |12;stanford-crypto-pbkdf2;162;151;159;161;160;150;164;161;161;150 16:41:52 INFO - 2015-10-22 16:41:52,062 DEBUG : BROWSER_OUTPUT: |13;stanford-crypto-sha256-iterative;74;75;77;75;75;75;75;75;76;75 16:41:52 INFO - 2015-10-22 16:41:52,062 DEBUG : BROWSER_OUTPUT: __end_tp_report 16:41:52 INFO - 2015-10-22 16:41:52,062 DEBUG : BROWSER_OUTPUT: __start_cc_report 16:41:52 INFO - 2015-10-22 16:41:52,062 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_cycle_collect,974 16:41:52 INFO - 2015-10-22 16:41:52,062 DEBUG : BROWSER_OUTPUT: __end_cc_report 16:41:52 INFO - 2015-10-22 16:41:52,062 DEBUG : BROWSER_OUTPUT: __startTimestamp1445557312061__endTimestamp 16:41:52 INFO - 2015-10-22 16:41:52,062 DEBUG : BROWSER_OUTPUT: 16:41:52 INFO - 2015-10-22 16:41:52,068 DEBUG : BROWSER_OUTPUT: ------- Summary: start ------- 16:41:52 INFO - 2015-10-22 16:41:52,068 DEBUG : BROWSER_OUTPUT: Number of tests: 14 16:41:52 INFO - 2015-10-22 16:41:52,068 DEBUG : BROWSER_OUTPUT: 16:41:52 INFO - 2015-10-22 16:41:52,068 DEBUG : BROWSER_OUTPUT: [#0] ai-astar Cycles:10 Average:110.40 Median:111.50 stddev:2.50 (2.2%) stddev-sans-first:2.59 16:41:52 INFO - 2015-10-22 16:41:52,068 DEBUG : BROWSER_OUTPUT: Values: 112.0 110.0 107.0 111.0 111.0 112.0 112.0 111.0 105.0 113.0 16:41:52 INFO - 2015-10-22 16:41:52,068 DEBUG : BROWSER_OUTPUT: 16:41:52 INFO - 2015-10-22 16:41:52,068 DEBUG : BROWSER_OUTPUT: [#1] audio-beat-detection Cycles:10 Average:140.10 Median:137.50 stddev:10.92 (7.9%) stddev-sans-first:11.55 16:41:52 INFO - 2015-10-22 16:41:52,068 DEBUG : BROWSER_OUTPUT: Values: 138.0 130.0 147.0 158.0 134.0 137.0 137.0 130.0 159.0 131.0 16:41:52 INFO - 2015-10-22 16:41:52,068 DEBUG : BROWSER_OUTPUT: 16:41:52 INFO - 2015-10-22 16:41:52,068 DEBUG : BROWSER_OUTPUT: [#2] audio-dft Cycles:10 Average:141.90 Median:141.00 stddev:3.31 (2.4%) stddev-sans-first:3.50 16:41:52 INFO - 2015-10-22 16:41:52,068 DEBUG : BROWSER_OUTPUT: Values: 141.0 141.0 141.0 151.0 140.0 141.0 141.0 143.0 140.0 140.0 16:41:52 INFO - 2015-10-22 16:41:52,068 DEBUG : BROWSER_OUTPUT: 16:41:52 INFO - 2015-10-22 16:41:52,068 DEBUG : BROWSER_OUTPUT: [#3] audio-fft Cycles:10 Average:76.10 Median:71.00 stddev:11.54 (16.3%) stddev-sans-first:11.95 16:41:52 INFO - 2015-10-22 16:41:52,069 DEBUG : BROWSER_OUTPUT: Values: 69.0 71.0 70.0 91.0 76.0 71.0 70.0 71.0 103.0 69.0 16:41:52 INFO - 2015-10-22 16:41:52,069 DEBUG : BROWSER_OUTPUT: 16:41:52 INFO - 2015-10-22 16:41:52,069 DEBUG : BROWSER_OUTPUT: [#4] audio-oscillator Cycles:10 Average:99.30 Median:92.00 stddev:12.39 (13.5%) stddev-sans-first:12.86 16:41:52 INFO - 2015-10-22 16:41:52,069 DEBUG : BROWSER_OUTPUT: Values: 92.0 92.0 112.0 92.0 91.0 92.0 119.0 92.0 91.0 120.0 16:41:52 INFO - 2015-10-22 16:41:52,069 DEBUG : BROWSER_OUTPUT: 16:41:52 INFO - 2015-10-22 16:41:52,069 DEBUG : BROWSER_OUTPUT: [#5] imaging-gaussian-blur Cycles:10 Average:110.70 Median:111.00 stddev:0.48 (0.4%) stddev-sans-first:0.50 16:41:52 INFO - 2015-10-22 16:41:52,069 DEBUG : BROWSER_OUTPUT: Values: 111.0 110.0 111.0 111.0 111.0 111.0 111.0 110.0 111.0 110.0 16:41:52 INFO - 2015-10-22 16:41:52,069 DEBUG : BROWSER_OUTPUT: 16:41:52 INFO - 2015-10-22 16:41:52,069 DEBUG : BROWSER_OUTPUT: [#6] imaging-darkroom Cycles:10 Average:136.40 Median:132.50 stddev:14.29 (10.8%) stddev-sans-first:15.02 16:41:52 INFO - 2015-10-22 16:41:52,069 DEBUG : BROWSER_OUTPUT: Values: 131.0 131.0 131.0 177.0 131.0 133.0 132.0 132.0 133.0 133.0 16:41:52 INFO - 2015-10-22 16:41:52,069 DEBUG : BROWSER_OUTPUT: 16:41:52 INFO - 2015-10-22 16:41:52,069 DEBUG : BROWSER_OUTPUT: [#7] imaging-desaturate Cycles:10 Average:98.90 Median:96.50 stddev:7.78 (8.1%) stddev-sans-first:8.22 16:41:52 INFO - 2015-10-22 16:41:52,069 DEBUG : BROWSER_OUTPUT: Values: 97.0 96.0 97.0 96.0 96.0 121.0 97.0 96.0 96.0 97.0 16:41:52 INFO - 2015-10-22 16:41:52,069 DEBUG : BROWSER_OUTPUT: 16:41:52 INFO - 2015-10-22 16:41:52,069 DEBUG : BROWSER_OUTPUT: [#8] json-parse-financial Cycles:10 Average:71.30 Median:70.00 stddev:4.16 (5.9%) stddev-sans-first:4.39 16:41:52 INFO - 2015-10-22 16:41:52,069 DEBUG : BROWSER_OUTPUT: Values: 70.0 71.0 70.0 70.0 71.0 69.0 70.0 83.0 70.0 69.0 16:41:52 INFO - 2015-10-22 16:41:52,069 DEBUG : BROWSER_OUTPUT: 16:41:52 INFO - 2015-10-22 16:41:52,069 DEBUG : BROWSER_OUTPUT: [#9] json-stringify-tinderbox Cycles:10 Average:67.80 Median:68.00 stddev:0.42 (0.6%) stddev-sans-first:0.44 16:41:52 INFO - 2015-10-22 16:41:52,069 DEBUG : BROWSER_OUTPUT: Values: 68.0 68.0 68.0 68.0 67.0 68.0 67.0 68.0 68.0 68.0 16:41:52 INFO - 2015-10-22 16:41:52,069 DEBUG : BROWSER_OUTPUT: 16:41:52 INFO - 2015-10-22 16:41:52,069 DEBUG : BROWSER_OUTPUT: [#10] stanford-crypto-aes Cycles:10 Average:93.00 Median:92.50 stddev:2.94 (3.2%) stddev-sans-first:3.03 16:41:52 INFO - 2015-10-22 16:41:52,069 DEBUG : BROWSER_OUTPUT: Values: 91.0 92.0 91.0 91.0 93.0 92.0 101.0 93.0 93.0 93.0 16:41:52 INFO - 2015-10-22 16:41:52,069 DEBUG : BROWSER_OUTPUT: 16:41:52 INFO - 2015-10-22 16:41:52,069 DEBUG : BROWSER_OUTPUT: [#11] stanford-crypto-ccm Cycles:10 Average:129.70 Median:130.50 stddev:5.25 (4.0%) stddev-sans-first:5.33 16:41:52 INFO - 2015-10-22 16:41:52,069 DEBUG : BROWSER_OUTPUT: Values: 134.0 126.0 129.0 126.0 133.0 126.0 125.0 125.0 132.0 141.0 16:41:52 INFO - 2015-10-22 16:41:52,069 DEBUG : BROWSER_OUTPUT: 16:41:52 INFO - 2015-10-22 16:41:52,069 DEBUG : BROWSER_OUTPUT: [#12] stanford-crypto-pbkdf2 Cycles:10 Average:157.90 Median:161.00 stddev:5.38 (3.3%) stddev-sans-first:5.50 16:41:52 INFO - 2015-10-22 16:41:52,069 DEBUG : BROWSER_OUTPUT: Values: 162.0 151.0 159.0 161.0 160.0 150.0 164.0 161.0 161.0 150.0 16:41:52 INFO - 2015-10-22 16:41:52,071 DEBUG : BROWSER_OUTPUT: 16:41:52 INFO - 2015-10-22 16:41:52,071 DEBUG : BROWSER_OUTPUT: [#13] stanford-crypto-sha256-iterative Cycles:10 Average:75.20 Median:75.00 stddev:0.79 (1.1%) stddev-sans-first:0.71 16:41:52 INFO - 2015-10-22 16:41:52,071 DEBUG : BROWSER_OUTPUT: Values: 74.0 75.0 77.0 75.0 75.0 75.0 75.0 75.0 76.0 75.0 16:41:52 INFO - 2015-10-22 16:41:52,071 DEBUG : BROWSER_OUTPUT: -------- Summary: end -------- 16:41:52 INFO - 2015-10-22 16:41:52,071 DEBUG : BROWSER_OUTPUT: 16:41:52 INFO - 2015-10-22 16:41:52,829 INFO : Browser exited with error code: 0 16:41:53 INFO - 2015-10-22 16:41:53,714 INFO : Completed test kraken (00:01:03) 16:41:53 INFO - 2015-10-22 16:41:53,714 INFO : Starting test v8_7 16:41:53 INFO - 2015-10-22 16:41:53,714 DEBUG : operating with platform_type : w8_ 16:41:53 INFO - 2015-10-22 16:41:53,714 INFO : Initialising browser for v8_7 test... 16:41:53 INFO - 2015-10-22 16:41:53,734 DEBUG : command line: C:\slave\test\build\application\firefox\firefox -profile c:\users\cltbld~1.t-w\appdata\local\temp\tmpyhvhks\profile http://localhost:49238/getInfo.html 16:42:00 INFO - 2015-10-22 16:42:00,069 DEBUG : BROWSER_OUTPUT: __metrics Screen width/height:1600/1200 16:42:00 INFO - 2015-10-22 16:42:00,069 DEBUG : BROWSER_OUTPUT: colorDepth:24 16:42:00 INFO - 2015-10-22 16:42:00,069 DEBUG : BROWSER_OUTPUT: Browser inner width/height: 1010/674 16:42:00 INFO - 2015-10-22 16:42:00,069 DEBUG : BROWSER_OUTPUT: __metrics 16:42:00 INFO - 2015-10-22 16:42:00,227 DEBUG : BROWSER_OUTPUT: JavaScript error: resource:///modules/WebappManager.jsm, line 48: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 16:42:00 INFO - 2015-10-22 16:42:00,700 DEBUG : BROWSER_OUTPUT: console.error: 16:42:00 INFO - 2015-10-22 16:42:00,700 DEBUG : BROWSER_OUTPUT: Message: [Exception... "Component returned failure code: 0x80040111 (NS_ERROR_NOT_AVAILABLE) [mozIStorageAsyncStatement.executeAsync]" nsresult: "0x80040111 (NS_ERROR_NOT_AVAILABLE)" location: "JS frame :: resource://gre/modules/Sqlite.jsm :: ConnectionData.prototype<._executeStatement :: line 758" data: no] 16:42:00 INFO - 2015-10-22 16:42:00,700 DEBUG : BROWSER_OUTPUT: Stack: 16:42:00 INFO - 2015-10-22 16:42:00,700 DEBUG : BROWSER_OUTPUT: ConnectionData.prototype<._executeStatement@resource://gre/modules/Sqlite.jsm:758:19 16:42:00 INFO - 2015-10-22 16:42:00,700 DEBUG : BROWSER_OUTPUT: ConnectionData.prototype<.executeCached/<@resource://gre/modules/Sqlite.jsm:493:9 16:42:00 INFO - 2015-10-22 16:42:00,700 DEBUG : BROWSER_OUTPUT: ConnectionData.prototype<.executeCached@resource://gre/modules/Sqlite.jsm:491:1 16:42:00 INFO - 2015-10-22 16:42:00,700 DEBUG : BROWSER_OUTPUT: ConnectionData.prototype<.executeBeforeShutdown/loggedDb<.executeCached.value<@resource://gre/modules/Sqlite.jsm:368:51 16:42:00 INFO - 2015-10-22 16:42:00,700 DEBUG : BROWSER_OUTPUT: TaskImpl_run@resource://gre/modules/Task.jsm:314:40 16:42:00 INFO - 2015-10-22 16:42:00,700 DEBUG : BROWSER_OUTPUT: TaskImpl@resource://gre/modules/Task.jsm:275:3 16:42:00 INFO - 2015-10-22 16:42:00,700 DEBUG : BROWSER_OUTPUT: createAsyncFunction/asyncFunction@resource://gre/modules/Task.jsm:249:14 16:42:00 INFO - 2015-10-22 16:42:00,700 DEBUG : BROWSER_OUTPUT: transaction@resource://gre/modules/Bookmarks.jsm:783:15 16:42:00 INFO - 2015-10-22 16:42:00,700 DEBUG : BROWSER_OUTPUT: TaskImpl_run@resource://gre/modules/Task.jsm:314:40 16:42:00 INFO - 2015-10-22 16:42:00,701 DEBUG : BROWSER_OUTPUT: TaskImpl@resource://gre/modules/Task.jsm:275:3 16:42:00 INFO - 2015-10-22 16:42:00,701 DEBUG : BROWSER_OUTPUT: createAsyncFunction/asyncFunction@resource://gre/modules/Task.jsm:249:14 16:42:00 INFO - 2015-10-22 16:42:00,701 DEBUG : BROWSER_OUTPUT: Task_spawn@resource://gre/modules/Task.jsm:164:12 16:42:00 INFO - 2015-10-22 16:42:00,701 DEBUG : BROWSER_OUTPUT: ConnectionData.prototype<.executeTransaction/promisedromaeo_css: 6113.13 16:42:37 INFO - RETURN: kraken: 1508.70 16:42:37 INFO - RETURN: v8_7: 20215.61 16:42:37 INFO - TinderboxPrint: TalosResult: {"graphserver": {"v8_7": {"url": "http://graphs.mozilla.org/graph.html#tests=[[230,132,31]]", "result": "20215.61"}, "kraken": {"url": "http://graphs.mozilla.org/graph.html#tests=[[232,132,31]]", "result": "1508.70"}, "dromaeo_css": {"url": "http://graphs.mozilla.org/graph.html#tests=[[72,132,31]]", "result": "6113.13"}}} 16:42:37 INFO - Return code: 0 16:42:37 INFO - # TBPL SUCCESS # 16:42:37 INFO - Running post-action listener: _resource_record_post_action 16:42:37 INFO - Running post-run listener: _resource_record_post_run 16:42:38 INFO - Total resource usage - Wall time: 1245s; CPU: 13.0%; Read bytes: 284688384; Write bytes: 386334208; Read time: 7621470; Write time: 4893970 16:42:38 INFO - install - Wall time: 2s; CPU: 11.0%; Read bytes: 15381504; Write bytes: 28854784; Read time: 392420; Write time: 147170 16:42:38 INFO - run-tests - Wall time: 1243s; CPU: 13.0%; Read bytes: 252500992; Write bytes: 344642560; Read time: 7059460; Write time: 4724120 16:42:38 INFO - Running post-run listener: _upload_blobber_files 16:42:38 INFO - Blob upload gear active. 16:42:38 INFO - There are no files to upload in the directory. Skipping the blob upload mechanism ... 16:42:38 INFO - Copying logs to upload dir... 16:42:38 INFO - mkdir: C:\slave\test\build\upload\logs program finished with exit code 0 elapsedTime=1509.715000 ========= Finished 'c:/mozilla-build/python27/python -u ...' (results: 0, elapsed: 25 mins, 9 secs) (at 2015-10-22 16:42:38.365792) ========= ========= Started set props: build_url (results: 0, elapsed: 0 secs) (at 2015-10-22 16:42:38.374647) ========= 'cmd' '/C' 'for' '%f' 'in' '(*)' 'do' '@type' '%f' in dir C:\slave\test\properties (timeout 1200 secs) watching logfiles {} argv: ['cmd', '/C', 'for', '%f', 'in', '(*)', 'do', '@type', '%f'] environment: ALLUSERSPROFILE=C:\ProgramData APPDATA=C:\Users\cltbld.T-W864-IX-155\AppData\Roaming COMMONPROGRAMFILES=C:\Program Files (x86)\Common Files COMMONPROGRAMFILES(X86)=C:\Program Files (x86)\Common Files COMMONPROGRAMW6432=C:\Program Files\Common Files COMPUTERNAME=T-W864-IX-155 COMSPEC=C:\windows\system32\cmd.exe DCLOCATION=SCL3 DNSSUFFIX=wintest.releng.scl3.mozilla.com FP_NO_HOST_CHECK=NO HOMEDRIVE=C: HOMEPATH=\Users\cltbld.T-W864-IX-155 KTS_HOME=C:\Program Files\KTS KTS_VERSION=1.19c LOCALAPPDATA=C:\Users\cltbld.T-W864-IX-155\AppData\Local LOGONSERVER=\\T-W864-IX-155 MONDIR=C:\Monitor_config\ MOZBUILDDIR=C:\mozilla-build\ MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NO_EM_RESTART=1 NUMBER_OF_PROCESSORS=8 OS=Windows_NT OURDRIVE=C: PATH=C:\Program Files (x86)\NVIDIA Corporation\PhysX\Common;C:\windows\system32;C:\windows;C:\windows\System32\Wbem;C:\windows\System32\WindowsPowerShell\v1.0\;C:\mozilla-build\python27;C:\mozilla-build\python27\Scripts;C:\mozilla-build\msys\bin;C:\mozilla-build\vim\vim72;C:\mozilla-build\wget;C:\mozilla-build\info-zip;C:\CoreUtils\bin;C:\mozilla-build\buildbotve\scripts;C:\mozilla-build\hg PATHEXT=.COM;.EXE;.BAT;.CMD;.VBS;.VBE;.JS;.JSE;.WSF;.WSH;.MSC PROCESSOR_ARCHITECTURE=x86 PROCESSOR_ARCHITEW6432=AMD64 PROCESSOR_IDENTIFIER=Intel64 Family 6 Model 30 Stepping 5, GenuineIntel PROCESSOR_LEVEL=6 PROCESSOR_REVISION=1e05 PROGRAMDATA=C:\ProgramData PROGRAMFILES=C:\Program Files (x86) PROGRAMFILES(X86)=C:\Program Files (x86) PROGRAMW6432=C:\Program Files PROMPT=$P$G PSMODULEPATH=C:\windows\system32\WindowsPowerShell\v1.0\Modules\ PUBLIC=C:\Users\Public PWD=C:\slave\test\properties RUNLOGFILE=C:\slave\\runslave.log SLAVEDIR=C:\slave\ SYSTEMDRIVE=C: SYSTEMROOT=C:\windows TEMP=C:\Users\CLTBLD~1.T-W\AppData\Local\Temp TEST1=testie TMP=C:\Users\CLTBLD~1.T-W\AppData\Local\Temp USERDOMAIN=T-W864-IX-155 USERDOMAIN_ROAMINGPROFILE=T-W864-IX-155 USERNAME=cltbld USERPROFILE=C:\Users\cltbld.T-W864-IX-155 WINDIR=C:\windows XPCOM_DEBUG_BREAK=warn using PTY: False build_url:https://queue.taskcluster.net/v1/task/lUgcNblFQ5mf-T41YEPb_Q/artifacts/public/build/firefox-44.0a1.en-US.win64.zip program finished with exit code 0 elapsedTime=0.101000 build_url: 'https://queue.taskcluster.net/v1/task/lUgcNblFQ5mf-T41YEPb_Q/artifacts/public/build/firefox-44.0a1.en-US.win64.zip' ========= Finished set props: build_url (results: 0, elapsed: 0 secs) (at 2015-10-22 16:42:38.780222) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2015-10-22 16:42:38.780580) ========= 'rm' '-f' 'oauth.txt' in dir C:\slave\test\. (timeout 1200 secs) watching logfiles {} argv: ['rm', '-f', 'oauth.txt'] environment: ALLUSERSPROFILE=C:\ProgramData APPDATA=C:\Users\cltbld.T-W864-IX-155\AppData\Roaming COMMONPROGRAMFILES=C:\Program Files (x86)\Common Files COMMONPROGRAMFILES(X86)=C:\Program Files (x86)\Common Files COMMONPROGRAMW6432=C:\Program Files\Common Files COMPUTERNAME=T-W864-IX-155 COMSPEC=C:\windows\system32\cmd.exe DCLOCATION=SCL3 DNSSUFFIX=wintest.releng.scl3.mozilla.com FP_NO_HOST_CHECK=NO HOMEDRIVE=C: HOMEPATH=\Users\cltbld.T-W864-IX-155 KTS_HOME=C:\Program Files\KTS KTS_VERSION=1.19c LOCALAPPDATA=C:\Users\cltbld.T-W864-IX-155\AppData\Local LOGONSERVER=\\T-W864-IX-155 MONDIR=C:\Monitor_config\ MOZBUILDDIR=C:\mozilla-build\ MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NO_EM_RESTART=1 NUMBER_OF_PROCESSORS=8 OS=Windows_NT OURDRIVE=C: PATH=C:\Program Files (x86)\NVIDIA Corporation\PhysX\Common;C:\windows\system32;C:\windows;C:\windows\System32\Wbem;C:\windows\System32\WindowsPowerShell\v1.0\;C:\mozilla-build\python27;C:\mozilla-build\python27\Scripts;C:\mozilla-build\msys\bin;C:\mozilla-build\vim\vim72;C:\mozilla-build\wget;C:\mozilla-build\info-zip;C:\CoreUtils\bin;C:\mozilla-build\buildbotve\scripts;C:\mozilla-build\hg PATHEXT=.COM;.EXE;.BAT;.CMD;.VBS;.VBE;.JS;.JSE;.WSF;.WSH;.MSC PROCESSOR_ARCHITECTURE=x86 PROCESSOR_ARCHITEW6432=AMD64 PROCESSOR_IDENTIFIER=Intel64 Family 6 Model 30 Stepping 5, GenuineIntel PROCESSOR_LEVEL=6 PROCESSOR_REVISION=1e05 PROGRAMDATA=C:\ProgramData PROGRAMFILES=C:\Program Files (x86) PROGRAMFILES(X86)=C:\Program Files (x86) PROGRAMW6432=C:\Program Files PROMPT=$P$G PSMODULEPATH=C:\windows\system32\WindowsPowerShell\v1.0\Modules\ PUBLIC=C:\Users\Public PWD=C:\slave\test RUNLOGFILE=C:\slave\\runslave.log SLAVEDIR=C:\slave\ SYSTEMDRIVE=C: SYSTEMROOT=C:\windows TEMP=C:\Users\CLTBLD~1.T-W\AppData\Local\Temp TEST1=testie TMP=C:\Users\CLTBLD~1.T-W\AppData\Local\Temp USERDOMAIN=T-W864-IX-155 USERDOMAIN_ROAMINGPROFILE=T-W864-IX-155 USERNAME=cltbld USERPROFILE=C:\Users\cltbld.T-W864-IX-155 WINDIR=C:\windows XPCOM_DEBUG_BREAK=warn using PTY: False program finished with exit code 0 elapsedTime=0.101000 ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2015-10-22 16:42:38.895493) ========= ========= Started reboot slave lost (results: 0, elapsed: 0 secs) (at 2015-10-22 16:42:38.895819) ========= ========= Finished reboot slave lost (results: 0, elapsed: 0 secs) (at 2015-10-22 16:42:39.453959) =========