builder: mozilla-inbound_win7-ix-debug_test-web-platform-tests-2 slave: t-w732-ix-036 starttime: 1445601535.88 results: success (0) buildid: 20151023030441 builduid: 3b55b41e9ea84798a041e21aa1ca0069 revision: af7f101376375a3d763bad927596b104cb638e95 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2015-10-23 04:58:55.881437) ========= master: http://buildbot-master109.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2015-10-23 04:58:55.883740) ========= ========= Started set props: basedir (results: 0, elapsed: 0 secs) (at 2015-10-23 04:58:55.884107) ========= 'cd' in dir C:\slave\test\. (timeout 1200 secs) watching logfiles {} argv: ['cd'] environment: ALLUSERSPROFILE=C:\ProgramData APPDATA=C:\Users\cltbld\AppData\Roaming COMMONPROGRAMFILES=C:\Program Files\Common Files COMPUTERNAME=T-W732-IX-036 COMSPEC=C:\windows\system32\cmd.exe DCLOCATION=SCL3 DNSSUFFIX=wintest.releng.scl3.mozilla.com FP_NO_HOST_CHECK=NO HOMEDRIVE=C: HOMEPATH=\Users\cltbld KTS_HOME=C:\Program Files\KTS KTS_VERSION=1.19c LOCALAPPDATA=C:\Users\cltbld\AppData\Local LOGONSERVER=\\T-W732-IX-036 MONDIR=C:\Monitor_config\ MOZBUILDDIR=C:\mozilla-build\ NUMBER_OF_PROCESSORS=8 OS=Windows_NT OURDRIVE=C: PATH=C:\Program Files\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:\Program Files\Microsoft Windows Performance Toolkit\;c:\mozilla-build\hg\;C:\mozilla-build\hg PATHEXT=.COM;.EXE;.BAT;.CMD;.VBS;.VBE;.JS;.JSE;.WSF;.WSH;.MSC PROCESSOR_ARCHITECTURE=x86 PROCESSOR_IDENTIFIER=x86 Family 6 Model 30 Stepping 5, GenuineIntel PROCESSOR_LEVEL=6 PROCESSOR_REVISION=1e05 PROGRAMDATA=C:\ProgramData PROGRAMFILES=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\AppData\Local\Temp TEST1=testie TMP=C:\Users\cltbld\AppData\Local\Temp USERDOMAIN=T-W732-IX-036 USERNAME=cltbld USERPROFILE=C:\Users\cltbld WINDIR=C:\windows WINDOWS_TRACING_FLAGS=3 WINDOWS_TRACING_LOGFILE=C:\BVTBin\Tests\installpackage\csilogfile.log using PTY: False C:\slave\test program finished with exit code 0 elapsedTime=0.551000 basedir: 'C:\\slave\\test' ========= Finished set props: basedir (results: 0, elapsed: 0 secs) (at 2015-10-23 04:58:56.486453) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2015-10-23 04:58:56.486943) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2015-10-23 04:58:56.707024) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-10-23 04:58:56.707557) ========= '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\AppData\Roaming COMMONPROGRAMFILES=C:\Program Files\Common Files COMPUTERNAME=T-W732-IX-036 COMSPEC=C:\windows\system32\cmd.exe DCLOCATION=SCL3 DNSSUFFIX=wintest.releng.scl3.mozilla.com FP_NO_HOST_CHECK=NO HOMEDRIVE=C: HOMEPATH=\Users\cltbld KTS_HOME=C:\Program Files\KTS KTS_VERSION=1.19c LOCALAPPDATA=C:\Users\cltbld\AppData\Local LOGONSERVER=\\T-W732-IX-036 MONDIR=C:\Monitor_config\ MOZBUILDDIR=C:\mozilla-build\ NUMBER_OF_PROCESSORS=8 OS=Windows_NT OURDRIVE=C: PATH=C:\Program Files\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:\Program Files\Microsoft Windows Performance Toolkit\;c:\mozilla-build\hg\;C:\mozilla-build\hg PATHEXT=.COM;.EXE;.BAT;.CMD;.VBS;.VBE;.JS;.JSE;.WSF;.WSH;.MSC PROCESSOR_ARCHITECTURE=x86 PROCESSOR_IDENTIFIER=x86 Family 6 Model 30 Stepping 5, GenuineIntel PROCESSOR_LEVEL=6 PROCESSOR_REVISION=1e05 PROGRAMDATA=C:\ProgramData PROGRAMFILES=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\AppData\Local\Temp TEST1=testie TMP=C:\Users\cltbld\AppData\Local\Temp USERDOMAIN=T-W732-IX-036 USERNAME=cltbld USERPROFILE=C:\Users\cltbld WINDIR=C:\windows WINDOWS_TRACING_FLAGS=3 WINDOWS_TRACING_LOGFILE=C:\BVTBin\Tests\installpackage\csilogfile.log using PTY: False program finished with exit code 0 elapsedTime=0.202000 ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-10-23 04:58:56.925555) ========= ========= Started set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2015-10-23 04:58:56.926088) ========= script_repo_url: https://hg.mozilla.org/build/mozharness ========= Finished set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2015-10-23 04:58:56.927282) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 8 secs) (at 2015-10-23 04:58:56.928032) ========= '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\AppData\Roaming COMMONPROGRAMFILES=C:\Program Files\Common Files COMPUTERNAME=T-W732-IX-036 COMSPEC=C:\windows\system32\cmd.exe DCLOCATION=SCL3 DNSSUFFIX=wintest.releng.scl3.mozilla.com FP_NO_HOST_CHECK=NO HOMEDRIVE=C: HOMEPATH=\Users\cltbld KTS_HOME=C:\Program Files\KTS KTS_VERSION=1.19c LOCALAPPDATA=C:\Users\cltbld\AppData\Local LOGONSERVER=\\T-W732-IX-036 MONDIR=C:\Monitor_config\ MOZBUILDDIR=C:\mozilla-build\ NUMBER_OF_PROCESSORS=8 OS=Windows_NT OURDRIVE=C: PATH=C:\Program Files\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:\Program Files\Microsoft Windows Performance Toolkit\;c:\mozilla-build\hg\;C:\mozilla-build\hg PATHEXT=.COM;.EXE;.BAT;.CMD;.VBS;.VBE;.JS;.JSE;.WSF;.WSH;.MSC PROCESSOR_ARCHITECTURE=x86 PROCESSOR_IDENTIFIER=x86 Family 6 Model 30 Stepping 5, GenuineIntel PROCESSOR_LEVEL=6 PROCESSOR_REVISION=1e05 PROGRAMDATA=C:\ProgramData PROGRAMFILES=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\AppData\Local\Temp TEST1=testie TMP=C:\Users\cltbld\AppData\Local\Temp USERDOMAIN=T-W732-IX-036 USERNAME=cltbld USERPROFILE=C:\Users\cltbld WINDIR=C:\windows WINDOWS_TRACING_FLAGS=3 WINDOWS_TRACING_LOGFILE=C:\BVTBin\Tests\installpackage\csilogfile.log using PTY: False --04:58:58-- 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% 2.27 GB/s 04:58:58 (2.27 GB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=1.130000 ========= Finished 'bash -c ...' (results: 0, elapsed: 8 secs) (at 2015-10-23 04:59:04.939388) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 4 secs) (at 2015-10-23 04:59:04.939671) ========= '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\AppData\Roaming COMMONPROGRAMFILES=C:\Program Files\Common Files COMPUTERNAME=T-W732-IX-036 COMSPEC=C:\windows\system32\cmd.exe DCLOCATION=SCL3 DNSSUFFIX=wintest.releng.scl3.mozilla.com FP_NO_HOST_CHECK=NO HOMEDRIVE=C: HOMEPATH=\Users\cltbld KTS_HOME=C:\Program Files\KTS KTS_VERSION=1.19c LOCALAPPDATA=C:\Users\cltbld\AppData\Local LOGONSERVER=\\T-W732-IX-036 MONDIR=C:\Monitor_config\ MOZBUILDDIR=C:\mozilla-build\ NUMBER_OF_PROCESSORS=8 OS=Windows_NT OURDRIVE=C: PATH=C:\Program Files\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:\Program Files\Microsoft Windows Performance Toolkit\;c:\mozilla-build\hg\;C:\mozilla-build\hg PATHEXT=.COM;.EXE;.BAT;.CMD;.VBS;.VBE;.JS;.JSE;.WSF;.WSH;.MSC PROCESSOR_ARCHITECTURE=x86 PROCESSOR_IDENTIFIER=x86 Family 6 Model 30 Stepping 5, GenuineIntel PROCESSOR_LEVEL=6 PROCESSOR_REVISION=1e05 PROGRAMDATA=C:\ProgramData PROGRAMFILES=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\AppData\Local\Temp TEST1=testie TMP=C:\Users\cltbld\AppData\Local\Temp USERDOMAIN=T-W732-IX-036 USERNAME=cltbld USERPROFILE=C:\Users\cltbld WINDIR=C:\windows WINDOWS_TRACING_FLAGS=3 WINDOWS_TRACING_LOGFILE=C:\BVTBin\Tests\installpackage\csilogfile.log using PTY: False program finished with exit code 0 elapsedTime=4.301000 ========= Finished 'rm -rf ...' (results: 0, elapsed: 4 secs) (at 2015-10-23 04:59:09.263441) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 9 secs) (at 2015-10-23 04:59:09.263860) ========= 'bash' '-c' u'python archiver_client.py mozharness --repo integration/mozilla-inbound --rev af7f101376375a3d763bad927596b104cb638e95 --destination scripts --debug' in dir C:\slave\test\. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', u'python archiver_client.py mozharness --repo integration/mozilla-inbound --rev af7f101376375a3d763bad927596b104cb638e95 --destination scripts --debug'] environment: ALLUSERSPROFILE=C:\ProgramData APPDATA=C:\Users\cltbld\AppData\Roaming COMMONPROGRAMFILES=C:\Program Files\Common Files COMPUTERNAME=T-W732-IX-036 COMSPEC=C:\windows\system32\cmd.exe DCLOCATION=SCL3 DNSSUFFIX=wintest.releng.scl3.mozilla.com FP_NO_HOST_CHECK=NO HOMEDRIVE=C: HOMEPATH=\Users\cltbld KTS_HOME=C:\Program Files\KTS KTS_VERSION=1.19c LOCALAPPDATA=C:\Users\cltbld\AppData\Local LOGONSERVER=\\T-W732-IX-036 MONDIR=C:\Monitor_config\ MOZBUILDDIR=C:\mozilla-build\ NUMBER_OF_PROCESSORS=8 OS=Windows_NT OURDRIVE=C: PATH=C:\Program Files\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:\Program Files\Microsoft Windows Performance Toolkit\;c:\mozilla-build\hg\;C:\mozilla-build\hg PATHEXT=.COM;.EXE;.BAT;.CMD;.VBS;.VBE;.JS;.JSE;.WSF;.WSH;.MSC PROCESSOR_ARCHITECTURE=x86 PROCESSOR_IDENTIFIER=x86 Family 6 Model 30 Stepping 5, GenuineIntel PROCESSOR_LEVEL=6 PROCESSOR_REVISION=1e05 PROGRAMDATA=C:\ProgramData PROGRAMFILES=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\AppData\Local\Temp TEST1=testie TMP=C:\Users\cltbld\AppData\Local\Temp USERDOMAIN=T-W732-IX-036 USERNAME=cltbld USERPROFILE=C:\Users\cltbld WINDIR=C:\windows WINDOWS_TRACING_FLAGS=3 WINDOWS_TRACING_LOGFILE=C:\BVTBin\Tests\installpackage\csilogfile.log using PTY: False 2015-10-23 04:59:10,089 truncating revision to first 12 chars 2015-10-23 04:59:10,089 Setting DEBUG logging. 2015-10-23 04:59:10,089 attempt 1/10 2015-10-23 04:59:10,089 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/integration/mozilla-inbound/af7f10137637?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2015-10-23 04:59:10,565 unpacking tar archive at: mozilla-inbound-af7f10137637/testing/mozharness/ program finished with exit code 0 elapsedTime=1.574000 ========= Finished 'bash -c ...' (results: 0, elapsed: 9 secs) (at 2015-10-23 04:59:18.290706) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2015-10-23 04:59:18.291090) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2015-10-23 04:59:18.321922) ========= ========= Started tinderboxprint_script_revlink (results: 0, elapsed: 0 secs) (at 2015-10-23 04:59:18.322568) ========= TinderboxPrint: script_revlink: https://hg.mozilla.org/build/mozharness/rev/production ========= Finished tinderboxprint_script_revlink (results: 0, elapsed: 0 secs) (at 2015-10-23 04:59:18.323218) ========= ========= Started 'c:/mozilla-build/python27/python -u ...' (results: 0, elapsed: 39 mins, 2 secs) (at 2015-10-23 04:59:18.323570) ========= 'c:/mozilla-build/python27/python' '-u' 'scripts/scripts/web_platform_tests.py' '--cfg' 'web_platform_tests/prod_config_windows.py' '--test-type=testharness' '--total-chunks' '8' '--this-chunk' '2' '--blob-upload-branch' 'mozilla-inbound' '--download-symbols' 'true' in dir C:\slave\test\. (timeout 1800 secs) (maxTime 7200 secs) watching logfiles {} argv: ['c:/mozilla-build/python27/python', '-u', 'scripts/scripts/web_platform_tests.py', '--cfg', 'web_platform_tests/prod_config_windows.py', '--test-type=testharness', '--total-chunks', '8', '--this-chunk', '2', '--blob-upload-branch', 'mozilla-inbound', '--download-symbols', 'true'] environment: ALLUSERSPROFILE=C:\ProgramData APPDATA=C:\Users\cltbld\AppData\Roaming COMMONPROGRAMFILES=C:\Program Files\Common Files COMPUTERNAME=T-W732-IX-036 COMSPEC=C:\windows\system32\cmd.exe DCLOCATION=SCL3 DNSSUFFIX=wintest.releng.scl3.mozilla.com DevEnvDir=D:\msvs8\Common7\IDE FP_NO_HOST_CHECK=NO FrameworkDir=C:\WINDOWS\Microsoft.NET\Framework FrameworkSDKDir=D:\msvs8\SDK\v2.0 FrameworkVersion=v2.0.50727 HOMEDRIVE=C: HOMEPATH=\Users\cltbld KTS_HOME=C:\Program Files\KTS KTS_VERSION=1.19c LIBPATH=C:\WINDOWS\Microsoft.NET\Framework\v2.0.50727;D:\msvs8\VC\ATLMFC\LIB LOCALAPPDATA=C:\Users\cltbld\AppData\Local LOGONSERVER=\\T-W732-IX-036 MONDIR=C:\Monitor_config\ MOZBUILDDIR=C:\mozilla-build\ MOZILLABUILD=D:\mozilla-build MOZILLABUILDDRIVE=C: MOZILLABUILDPATH=\mozilla-build\ MOZ_AIRBAG=1 MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_HIDE_RESULTS_TABLE=1 MOZ_MSVCVERSION=8 MOZ_NO_REMOTE=1 MOZ_TOOLS=D:\mozilla-build\moztools MSVCDir=D:\msvs8\VC NO_EM_RESTART=1 NO_FAIL_ON_TEST_ERRORS=1 NUMBER_OF_PROCESSORS=8 OS=Windows_NT OURDRIVE=C: PATH=C:\Program Files\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:\Program Files\Microsoft Windows Performance Toolkit\;c:\mozilla-build\hg\;C:\mozilla-build\hg PATHEXT=.COM;.EXE;.BAT;.CMD;.VBS;.VBE;.JS;.JSE;.WSF;.WSH;.MSC PROCESSOR_ARCHITECTURE=x86 PROCESSOR_IDENTIFIER=x86 Family 6 Model 30 Stepping 5, GenuineIntel PROCESSOR_LEVEL=6 PROCESSOR_REVISION=1e05 PROGRAMDATA=C:\ProgramData PROGRAMFILES=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\AppData\Local\Temp TEST1=testie TMP=C:\Users\cltbld\AppData\Local\Temp USERDOMAIN=T-W732-IX-036 USERNAME=cltbld USERPROFILE=C:\Users\cltbld VCINSTALLDIR=D:\msvs8\VC VCVARS=D:\msvs8\VC\bin\vcvars32.bat VSINSTALLDIR=D:\msvs8 WINDIR=C:\windows WINDOWS_TRACING_FLAGS=3 WINDOWS_TRACING_LOGFILE=C:\BVTBin\Tests\installpackage\csilogfile.log XPCOM_DEBUG_BREAK=warn using PTY: False 04:59:19 INFO - MultiFileLogger online at 20151023 04:59:19 in C:\slave\test 04:59:19 INFO - Run as scripts/scripts/web_platform_tests.py --cfg web_platform_tests/prod_config_windows.py --test-type=testharness --total-chunks 8 --this-chunk 2 --blob-upload-branch mozilla-inbound --download-symbols true 04:59:19 INFO - Dumping config to C:\slave\test\logs\localconfig.json. 04:59:19 INFO - {'append_to_log': False, 04:59:19 INFO - 'base_work_dir': 'C:\\slave\\test', 04:59:19 INFO - 'blob_upload_branch': 'mozilla-inbound', 04:59:19 INFO - 'blob_uploader_auth_file': 'C:\\slave\\test\\oauth.txt', 04:59:19 INFO - 'buildbot_json_path': 'buildprops.json', 04:59:19 INFO - 'config_files': ('web_platform_tests/prod_config_windows.py',), 04:59:19 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 04:59:19 INFO - 'download_minidump_stackwalk': True, 04:59:19 INFO - 'download_symbols': 'true', 04:59:19 INFO - 'exes': {'hg': 'c:/mozilla-build/hg/hg', 04:59:19 INFO - 'mozinstall': ('C:\\slave\\test/build/venv/scripts/python', 04:59:19 INFO - 'C:\\slave\\test/build/venv/scripts/mozinstall-script.py'), 04:59:19 INFO - 'python': 'c:\\mozilla-build\\python27\\python.exe', 04:59:19 INFO - 'tooltool.py': ('c:\\mozilla-build\\python27\\python.exe', 04:59:19 INFO - 'C:/mozilla-build/tooltool.py'), 04:59:19 INFO - 'virtualenv': ('c:\\mozilla-build\\python27\\python.exe', 04:59:19 INFO - 'c:/mozilla-build/buildbotve/virtualenv.py')}, 04:59:19 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 04:59:19 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 04:59:19 INFO - 'log_level': 'info', 04:59:19 INFO - 'log_to_console': True, 04:59:19 INFO - 'opt_config_files': (), 04:59:19 INFO - 'options': ('--prefs-root=%(test_path)s/prefs', 04:59:19 INFO - '--processes=1', 04:59:19 INFO - '--config=%(test_path)s/wptrunner.ini', 04:59:19 INFO - '--ca-cert-path=%(test_path)s/certs/cacert.pem', 04:59:19 INFO - '--host-key-path=%(test_path)s/certs/web-platform.test.key', 04:59:19 INFO - '--host-cert-path=%(test_path)s/certs/web-platform.test.pem', 04:59:19 INFO - '--certutil-binary=%(test_install_path)s/bin/certutil'), 04:59:19 INFO - 'pip_index': False, 04:59:19 INFO - 'require_test_zip': True, 04:59:19 INFO - 'test_type': ('testharness',), 04:59:19 INFO - 'this_chunk': '2', 04:59:19 INFO - 'total_chunks': '8', 04:59:19 INFO - 'virtualenv_path': 'venv', 04:59:19 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 04:59:19 INFO - 'work_dir': 'build'} 04:59:19 INFO - ##### 04:59:19 INFO - ##### Running clobber step. 04:59:19 INFO - ##### 04:59:19 INFO - Running pre-action listener: _resource_record_pre_action 04:59:19 INFO - Running main action method: clobber 04:59:19 INFO - rmtree: C:\slave\test\build 04:59:19 INFO - Using _rmtree_windows ... 04:59:19 INFO - retry: Calling _rmtree_windows with args: ('C:\\slave\\test\\build',), kwargs: {}, attempt #1 05:00:48 INFO - Running post-action listener: _resource_record_post_action 05:00:48 INFO - ##### 05:00:48 INFO - ##### Running read-buildbot-config step. 05:00:48 INFO - ##### 05:00:48 INFO - Running pre-action listener: _resource_record_pre_action 05:00:48 INFO - Running main action method: read_buildbot_config 05:00:48 INFO - Using buildbot properties: 05:00:48 INFO - { 05:00:48 INFO - "properties": { 05:00:48 INFO - "buildnumber": 388, 05:00:48 INFO - "product": "firefox", 05:00:48 INFO - "script_repo_revision": "production", 05:00:48 INFO - "branch": "mozilla-inbound", 05:00:48 INFO - "repository": "", 05:00:48 INFO - "buildername": "Windows 7 32-bit mozilla-inbound debug test web-platform-tests-2", 05:00:48 INFO - "buildid": "20151023030441", 05:00:48 INFO - "slavename": "t-w732-ix-036", 05:00:48 INFO - "pgo_build": "False", 05:00:48 INFO - "basedir": "C:\\slave\\test", 05:00:48 INFO - "project": "", 05:00:48 INFO - "platform": "win32", 05:00:48 INFO - "master": "http://buildbot-master109.bb.releng.scl3.mozilla.com:8201/", 05:00:48 INFO - "slavebuilddir": "test", 05:00:48 INFO - "scheduler": "tests-mozilla-inbound-win7-ix-debug-unittest-7-3600", 05:00:48 INFO - "repo_path": "integration/mozilla-inbound", 05:00:48 INFO - "moz_repo_path": "", 05:00:48 INFO - "stage_platform": "win32", 05:00:48 INFO - "builduid": "3b55b41e9ea84798a041e21aa1ca0069", 05:00:48 INFO - "revision": "af7f101376375a3d763bad927596b104cb638e95" 05:00:48 INFO - }, 05:00:48 INFO - "sourcestamp": { 05:00:48 INFO - "repository": "", 05:00:48 INFO - "hasPatch": false, 05:00:48 INFO - "project": "", 05:00:48 INFO - "branch": "mozilla-inbound-win32-debug-unittest", 05:00:48 INFO - "changes": [ 05:00:48 INFO - { 05:00:48 INFO - "category": null, 05:00:48 INFO - "files": [ 05:00:48 INFO - { 05:00:48 INFO - "url": null, 05:00:48 INFO - "name": "https://queue.taskcluster.net/v1/task/BOGSIk7ERc-4ToKCRzahaw/artifacts/public/build/firefox-44.0a1.en-US.win32.zip" 05:00:48 INFO - }, 05:00:48 INFO - { 05:00:48 INFO - "url": null, 05:00:48 INFO - "name": "https://queue.taskcluster.net/v1/task/BOGSIk7ERc-4ToKCRzahaw/artifacts/public/build/test_packages.json" 05:00:48 INFO - } 05:00:48 INFO - ], 05:00:48 INFO - "repository": "", 05:00:48 INFO - "rev": "bc7c5bc091207782385673c4eb70f54b189faa0c", 05:00:48 INFO - "who": "cbook@mozilla.com", 05:00:48 INFO - "when": 1445590736, 05:00:48 INFO - "number": 6564979, 05:00:48 INFO - "comments": "Bug 1206700 - Fix an bug in property assignment, recently exposed by Reflect.set. r=waldo\n\nSetExistingProperty() contains a fast path for the case when pobj and\nreceiver refer to the same object. Ordinarily, if that much is true,\nthen obj also refers to the same object, but with Reflect.set() it is\npossible to arrange for receiver == pobj to be true while obj is some\nother object.", 05:00:48 INFO - "project": "", 05:00:48 INFO - "at": "Fri 23 Oct 2015 01:58:56", 05:00:48 INFO - "branch": "mozilla-inbound-win32-debug-unittest", 05:00:48 INFO - "revlink": "", 05:00:48 INFO - "properties": [ 05:00:48 INFO - [ 05:00:48 INFO - "buildid", 05:00:48 INFO - "20151023001828", 05:00:48 INFO - "Change" 05:00:48 INFO - ], 05:00:48 INFO - [ 05:00:48 INFO - "builduid", 05:00:48 INFO - "34382ad9dbfe48819db35ffa0705ae63", 05:00:48 INFO - "Change" 05:00:48 INFO - ], 05:00:48 INFO - [ 05:00:48 INFO - "pgo_build", 05:00:48 INFO - "False", 05:00:48 INFO - "Change" 05:00:48 INFO - ] 05:00:48 INFO - ], 05:00:48 INFO - "revision": "bc7c5bc091207782385673c4eb70f54b189faa0c" 05:00:48 INFO - }, 05:00:48 INFO - { 05:00:48 INFO - "category": null, 05:00:48 INFO - "files": [ 05:00:48 INFO - { 05:00:48 INFO - "url": null, 05:00:48 INFO - "name": "https://queue.taskcluster.net/v1/task/3gQJ3olTS5aN2tDEfGiWPw/artifacts/public/build/firefox-44.0a1.en-US.win32.zip" 05:00:48 INFO - }, 05:00:48 INFO - { 05:00:48 INFO - "url": null, 05:00:48 INFO - "name": "https://queue.taskcluster.net/v1/task/3gQJ3olTS5aN2tDEfGiWPw/artifacts/public/build/test_packages.json" 05:00:48 INFO - } 05:00:48 INFO - ], 05:00:48 INFO - "repository": "", 05:00:48 INFO - "rev": "ad80366135f31aa550911d7911ce6352dc5369d3", 05:00:48 INFO - "who": "cbook@mozilla.com", 05:00:48 INFO - "when": 1445591400, 05:00:48 INFO - "number": 6565045, 05:00:48 INFO - "comments": "Bug 1216582 - [gtk3] Scrollbar buttons not drawn correctly. r=karlt", 05:00:48 INFO - "project": "", 05:00:48 INFO - "at": "Fri 23 Oct 2015 02:10:00", 05:00:48 INFO - "branch": "mozilla-inbound-win32-debug-unittest", 05:00:48 INFO - "revlink": "", 05:00:48 INFO - "properties": [ 05:00:48 INFO - [ 05:00:48 INFO - "buildid", 05:00:48 INFO - "20151023002139", 05:00:48 INFO - "Change" 05:00:48 INFO - ], 05:00:48 INFO - [ 05:00:48 INFO - "builduid", 05:00:48 INFO - "55a934e8821b485ab1dc8560bd7d236d", 05:00:48 INFO - "Change" 05:00:48 INFO - ], 05:00:48 INFO - [ 05:00:48 INFO - "pgo_build", 05:00:48 INFO - "False", 05:00:48 INFO - "Change" 05:00:48 INFO - ] 05:00:48 INFO - ], 05:00:48 INFO - "revision": "ad80366135f31aa550911d7911ce6352dc5369d3" 05:00:48 INFO - }, 05:00:48 INFO - { 05:00:48 INFO - "category": null, 05:00:48 INFO - "files": [ 05:00:48 INFO - { 05:00:48 INFO - "url": null, 05:00:48 INFO - "name": "https://queue.taskcluster.net/v1/task/I1FjuhJST3WUF82ydnFXLA/artifacts/public/build/firefox-44.0a1.en-US.win32.zip" 05:00:48 INFO - }, 05:00:48 INFO - { 05:00:48 INFO - "url": null, 05:00:48 INFO - "name": "https://queue.taskcluster.net/v1/task/I1FjuhJST3WUF82ydnFXLA/artifacts/public/build/test_packages.json" 05:00:48 INFO - } 05:00:48 INFO - ], 05:00:48 INFO - "repository": "", 05:00:48 INFO - "rev": "8315a152ccb1cb77d57652daf7ce5ab688582ced", 05:00:48 INFO - "who": "cbook@mozilla.com", 05:00:48 INFO - "when": 1445592308, 05:00:48 INFO - "number": 6565118, 05:00:48 INFO - "comments": "Bug 1217192 - Use gfxCriticalNote where we're already using the non-default construction parameter. r=mchang", 05:00:48 INFO - "project": "", 05:00:48 INFO - "at": "Fri 23 Oct 2015 02:25:08", 05:00:48 INFO - "branch": "mozilla-inbound-win32-debug-unittest", 05:00:48 INFO - "revlink": "", 05:00:48 INFO - "properties": [ 05:00:48 INFO - [ 05:00:48 INFO - "buildid", 05:00:48 INFO - "20151023002434", 05:00:48 INFO - "Change" 05:00:48 INFO - ], 05:00:48 INFO - [ 05:00:48 INFO - "builduid", 05:00:48 INFO - "2eec6495749c4acca2d809c897537ba9", 05:00:48 INFO - "Change" 05:00:48 INFO - ], 05:00:48 INFO - [ 05:00:48 INFO - "pgo_build", 05:00:48 INFO - "False", 05:00:48 INFO - "Change" 05:00:48 INFO - ] 05:00:48 INFO - ], 05:00:48 INFO - "revision": "8315a152ccb1cb77d57652daf7ce5ab688582ced" 05:00:48 INFO - }, 05:00:48 INFO - { 05:00:48 INFO - "category": null, 05:00:48 INFO - "files": [ 05:00:48 INFO - { 05:00:48 INFO - "url": null, 05:00:48 INFO - "name": "https://queue.taskcluster.net/v1/task/wlGmOeO8RqW9nsq--lKZ6Q/artifacts/public/build/firefox-44.0a1.en-US.win32.zip" 05:00:48 INFO - }, 05:00:48 INFO - { 05:00:48 INFO - "url": null, 05:00:48 INFO - "name": "https://queue.taskcluster.net/v1/task/wlGmOeO8RqW9nsq--lKZ6Q/artifacts/public/build/test_packages.json" 05:00:48 INFO - } 05:00:48 INFO - ], 05:00:48 INFO - "repository": "", 05:00:48 INFO - "rev": "2353ad287e4dfe7018d54c5e223eee73d59663d0", 05:00:48 INFO - "who": "cbook@mozilla.com", 05:00:48 INFO - "when": 1445593137, 05:00:48 INFO - "number": 6565194, 05:00:48 INFO - "comments": "Bug 1217250 - Fix some IPDL tests that were broken by bug 1212027; r=froydnj", 05:00:48 INFO - "project": "", 05:00:48 INFO - "at": "Fri 23 Oct 2015 02:38:57", 05:00:48 INFO - "branch": "mozilla-inbound-win32-debug-unittest", 05:00:48 INFO - "revlink": "", 05:00:48 INFO - "properties": [ 05:00:48 INFO - [ 05:00:48 INFO - "buildid", 05:00:48 INFO - "20151023002528", 05:00:48 INFO - "Change" 05:00:48 INFO - ], 05:00:48 INFO - [ 05:00:48 INFO - "builduid", 05:00:48 INFO - "b3fb37fe304d485d990119b56c40ced3", 05:00:48 INFO - "Change" 05:00:48 INFO - ], 05:00:48 INFO - [ 05:00:48 INFO - "pgo_build", 05:00:48 INFO - "False", 05:00:48 INFO - "Change" 05:00:48 INFO - ] 05:00:48 INFO - ], 05:00:48 INFO - "revision": "2353ad287e4dfe7018d54c5e223eee73d59663d0" 05:00:48 INFO - }, 05:00:48 INFO - { 05:00:48 INFO - "category": null, 05:00:48 INFO - "files": [ 05:00:48 INFO - { 05:00:48 INFO - "url": null, 05:00:48 INFO - "name": "https://queue.taskcluster.net/v1/task/9At39RwZR42lL7vNdol5YA/artifacts/public/build/firefox-44.0a1.en-US.win32.zip" 05:00:48 INFO - }, 05:00:48 INFO - { 05:00:48 INFO - "url": null, 05:00:48 INFO - "name": "https://queue.taskcluster.net/v1/task/9At39RwZR42lL7vNdol5YA/artifacts/public/build/test_packages.json" 05:00:48 INFO - } 05:00:48 INFO - ], 05:00:48 INFO - "repository": "", 05:00:48 INFO - "rev": "798a61cdcf78b39e27238650aca8197bfef8a6b9", 05:00:48 INFO - "who": "xquan@mozilla.com", 05:00:48 INFO - "when": 1445596222, 05:00:48 INFO - "number": 6565386, 05:00:48 INFO - "comments": "Bug 1206468 - Remove unused internal appearance value -moz-mac-unified-toolbar. r=mstange", 05:00:48 INFO - "project": "", 05:00:48 INFO - "at": "Fri 23 Oct 2015 03:30:22", 05:00:48 INFO - "branch": "mozilla-inbound-win32-debug-unittest", 05:00:48 INFO - "revlink": "", 05:00:48 INFO - "properties": [ 05:00:48 INFO - [ 05:00:48 INFO - "buildid", 05:00:48 INFO - "20151023015232", 05:00:48 INFO - "Change" 05:00:48 INFO - ], 05:00:48 INFO - [ 05:00:48 INFO - "builduid", 05:00:48 INFO - "53da23e490e44a0c842b0acfdbf8588d", 05:00:48 INFO - "Change" 05:00:48 INFO - ], 05:00:48 INFO - [ 05:00:48 INFO - "pgo_build", 05:00:48 INFO - "False", 05:00:48 INFO - "Change" 05:00:48 INFO - ] 05:00:48 INFO - ], 05:00:48 INFO - "revision": "798a61cdcf78b39e27238650aca8197bfef8a6b9" 05:00:48 INFO - }, 05:00:48 INFO - { 05:00:48 INFO - "category": null, 05:00:48 INFO - "files": [ 05:00:48 INFO - { 05:00:48 INFO - "url": null, 05:00:48 INFO - "name": "https://queue.taskcluster.net/v1/task/WzTS5d3HS0-8rQwoL52nIg/artifacts/public/build/firefox-44.0a1.en-US.win32.zip" 05:00:48 INFO - }, 05:00:48 INFO - { 05:00:48 INFO - "url": null, 05:00:48 INFO - "name": "https://queue.taskcluster.net/v1/task/WzTS5d3HS0-8rQwoL52nIg/artifacts/public/build/test_packages.json" 05:00:48 INFO - } 05:00:48 INFO - ], 05:00:48 INFO - "repository": "", 05:00:48 INFO - "rev": "9ece884a2db8ef6258b124d5ac6acd6c889045af", 05:00:48 INFO - "who": "cbook@mozilla.com", 05:00:48 INFO - "when": 1445599081, 05:00:48 INFO - "number": 6565616, 05:00:48 INFO - "comments": "Merge m-c to mozilla-inbound", 05:00:48 INFO - "project": "", 05:00:48 INFO - "at": "Fri 23 Oct 2015 04:18:01", 05:00:48 INFO - "branch": "mozilla-inbound-win32-debug-unittest", 05:00:48 INFO - "revlink": "", 05:00:48 INFO - "properties": [ 05:00:48 INFO - [ 05:00:48 INFO - "buildid", 05:00:48 INFO - "20151023024933", 05:00:48 INFO - "Change" 05:00:48 INFO - ], 05:00:48 INFO - [ 05:00:48 INFO - "builduid", 05:00:48 INFO - "3a78be2383354b7fa4341aaf7c84952c", 05:00:48 INFO - "Change" 05:00:48 INFO - ], 05:00:48 INFO - [ 05:00:48 INFO - "pgo_build", 05:00:48 INFO - "False", 05:00:48 INFO - "Change" 05:00:48 INFO - ] 05:00:48 INFO - ], 05:00:48 INFO - "revision": "9ece884a2db8ef6258b124d5ac6acd6c889045af" 05:00:48 INFO - }, 05:00:48 INFO - { 05:00:48 INFO - "category": null, 05:00:48 INFO - "files": [ 05:00:48 INFO - { 05:00:48 INFO - "url": null, 05:00:48 INFO - "name": "https://queue.taskcluster.net/v1/task/jxSRwR8PR_GyBpAobsIybg/artifacts/public/build/firefox-44.0a1.en-US.win32.zip" 05:00:48 INFO - }, 05:00:48 INFO - { 05:00:48 INFO - "url": null, 05:00:48 INFO - "name": "https://queue.taskcluster.net/v1/task/jxSRwR8PR_GyBpAobsIybg/artifacts/public/build/test_packages.json" 05:00:48 INFO - } 05:00:48 INFO - ], 05:00:48 INFO - "repository": "", 05:00:48 INFO - "rev": "af7f101376375a3d763bad927596b104cb638e95", 05:00:48 INFO - "who": "james@hoppipolla.co.uk", 05:00:48 INFO - "when": 1445600679, 05:00:48 INFO - "number": 6565701, 05:00:48 INFO - "comments": "Bug 1217767 - Update web-platform-tests expected data to revision 9a49a8ea7405280364a8aa27d47bfb19af119bb4, a=testonly\n", 05:00:48 INFO - "project": "", 05:00:48 INFO - "at": "Fri 23 Oct 2015 04:44:39", 05:00:48 INFO - "branch": "mozilla-inbound-win32-debug-unittest", 05:00:48 INFO - "revlink": "", 05:00:48 INFO - "properties": [ 05:00:48 INFO - [ 05:00:48 INFO - "buildid", 05:00:48 INFO - "20151023030441", 05:00:48 INFO - "Change" 05:00:48 INFO - ], 05:00:48 INFO - [ 05:00:48 INFO - "builduid", 05:00:48 INFO - "3b55b41e9ea84798a041e21aa1ca0069", 05:00:48 INFO - "Change" 05:00:48 INFO - ], 05:00:48 INFO - [ 05:00:48 INFO - "pgo_build", 05:00:48 INFO - "False", 05:00:48 INFO - "Change" 05:00:48 INFO - ] 05:00:48 INFO - ], 05:00:48 INFO - "revision": "af7f101376375a3d763bad927596b104cb638e95" 05:00:48 INFO - } 05:00:48 INFO - ], 05:00:48 INFO - "revision": "af7f101376375a3d763bad927596b104cb638e95" 05:00:48 INFO - } 05:00:48 INFO - } 05:00:48 INFO - Found installer url https://queue.taskcluster.net/v1/task/jxSRwR8PR_GyBpAobsIybg/artifacts/public/build/firefox-44.0a1.en-US.win32.zip. 05:00:48 INFO - Found a test packages url https://queue.taskcluster.net/v1/task/jxSRwR8PR_GyBpAobsIybg/artifacts/public/build/test_packages.json. 05:00:48 INFO - Running post-action listener: _resource_record_post_action 05:00:48 INFO - ##### 05:00:48 INFO - ##### Running download-and-extract step. 05:00:48 INFO - ##### 05:00:48 INFO - Running pre-action listener: _resource_record_pre_action 05:00:48 INFO - Running main action method: download_and_extract 05:00:48 INFO - mkdir: C:\slave\test\build\tests 05:00:48 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')]} 05:00:48 INFO - https://queue.taskcluster.net/v1/task/jxSRwR8PR_GyBpAobsIybg/artifacts/public/build/test_packages.json matches https://queue.taskcluster.net 05:00:48 INFO - trying https://queue.taskcluster.net/v1/task/jxSRwR8PR_GyBpAobsIybg/artifacts/public/build/test_packages.json 05:00:48 INFO - Downloading https://queue.taskcluster.net/v1/task/jxSRwR8PR_GyBpAobsIybg/artifacts/public/build/test_packages.json to C:\slave\test\build\test_packages.json 05:00:48 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/jxSRwR8PR_GyBpAobsIybg/artifacts/public/build/test_packages.json', 'file_name': 'C:\\slave\\test\\build\\test_packages.json'}, attempt #1 05:00:49 INFO - Downloaded 1221 bytes. 05:00:49 INFO - Reading from file C:\slave\test\build\test_packages.json 05:00:49 INFO - Using the following test package requirements: 05:00:49 INFO - {u'common': [u'firefox-44.0a1.en-US.win32.common.tests.zip'], 05:00:49 INFO - u'cppunittest': [u'firefox-44.0a1.en-US.win32.common.tests.zip', 05:00:49 INFO - u'firefox-44.0a1.en-US.win32.cppunittest.tests.zip'], 05:00:49 INFO - u'jittest': [u'firefox-44.0a1.en-US.win32.common.tests.zip', 05:00:49 INFO - u'jsshell-win32.zip'], 05:00:49 INFO - u'mochitest': [u'firefox-44.0a1.en-US.win32.common.tests.zip', 05:00:49 INFO - u'firefox-44.0a1.en-US.win32.mochitest.tests.zip'], 05:00:49 INFO - u'mozbase': [u'firefox-44.0a1.en-US.win32.common.tests.zip'], 05:00:49 INFO - u'reftest': [u'firefox-44.0a1.en-US.win32.common.tests.zip', 05:00:49 INFO - u'firefox-44.0a1.en-US.win32.reftest.tests.zip'], 05:00:49 INFO - u'talos': [u'firefox-44.0a1.en-US.win32.common.tests.zip', 05:00:49 INFO - u'firefox-44.0a1.en-US.win32.talos.tests.zip'], 05:00:49 INFO - u'web-platform': [u'firefox-44.0a1.en-US.win32.common.tests.zip', 05:00:49 INFO - u'firefox-44.0a1.en-US.win32.web-platform.tests.zip'], 05:00:49 INFO - u'webapprt': [u'firefox-44.0a1.en-US.win32.common.tests.zip'], 05:00:49 INFO - u'xpcshell': [u'firefox-44.0a1.en-US.win32.common.tests.zip', 05:00:49 INFO - u'firefox-44.0a1.en-US.win32.xpcshell.tests.zip']} 05:00:49 INFO - Downloading packages: [u'firefox-44.0a1.en-US.win32.common.tests.zip', u'firefox-44.0a1.en-US.win32.web-platform.tests.zip'] for test suite category: web-platform 05:00: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')]} 05:00:49 INFO - https://queue.taskcluster.net/v1/task/jxSRwR8PR_GyBpAobsIybg/artifacts/public/build/firefox-44.0a1.en-US.win32.common.tests.zip matches https://queue.taskcluster.net 05:00:49 INFO - trying https://queue.taskcluster.net/v1/task/jxSRwR8PR_GyBpAobsIybg/artifacts/public/build/firefox-44.0a1.en-US.win32.common.tests.zip 05:00:49 INFO - Downloading https://queue.taskcluster.net/v1/task/jxSRwR8PR_GyBpAobsIybg/artifacts/public/build/firefox-44.0a1.en-US.win32.common.tests.zip to C:\slave\test\build\firefox-44.0a1.en-US.win32.common.tests.zip 05:00:49 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/jxSRwR8PR_GyBpAobsIybg/artifacts/public/build/firefox-44.0a1.en-US.win32.common.tests.zip', 'file_name': u'C:\\slave\\test\\build\\firefox-44.0a1.en-US.win32.common.tests.zip'}, attempt #1 05:00:51 INFO - Downloaded 19137906 bytes. 05:00:51 INFO - Running command: ['unzip', '-q', '-o', u'C:\\slave\\test\\build\\firefox-44.0a1.en-US.win32.common.tests.zip', 'bin/*', 'config/*', 'mozbase/*', 'marionette/*', 'web-platform/*'] in C:\slave\test\build\tests 05:00:51 INFO - Copy/paste: unzip -q -o C:\slave\test\build\firefox-44.0a1.en-US.win32.common.tests.zip bin/* config/* mozbase/* marionette/* web-platform/* 05:00:51 INFO - Calling ['unzip', '-q', '-o', u'C:\\slave\\test\\build\\firefox-44.0a1.en-US.win32.common.tests.zip', 'bin/*', 'config/*', 'mozbase/*', 'marionette/*', 'web-platform/*'] with output_timeout 1760 05:00:53 INFO - caution: filename not matched: web-platform/* 05:00:53 INFO - Return code: 11 05:00: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')]} 05:00:53 INFO - https://queue.taskcluster.net/v1/task/jxSRwR8PR_GyBpAobsIybg/artifacts/public/build/firefox-44.0a1.en-US.win32.web-platform.tests.zip matches https://queue.taskcluster.net 05:00:53 INFO - trying https://queue.taskcluster.net/v1/task/jxSRwR8PR_GyBpAobsIybg/artifacts/public/build/firefox-44.0a1.en-US.win32.web-platform.tests.zip 05:00:53 INFO - Downloading https://queue.taskcluster.net/v1/task/jxSRwR8PR_GyBpAobsIybg/artifacts/public/build/firefox-44.0a1.en-US.win32.web-platform.tests.zip to C:\slave\test\build\firefox-44.0a1.en-US.win32.web-platform.tests.zip 05:00:53 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/jxSRwR8PR_GyBpAobsIybg/artifacts/public/build/firefox-44.0a1.en-US.win32.web-platform.tests.zip', 'file_name': u'C:\\slave\\test\\build\\firefox-44.0a1.en-US.win32.web-platform.tests.zip'}, attempt #1 05:00:55 INFO - Downloaded 30908939 bytes. 05:00:55 INFO - Running command: ['unzip', '-q', '-o', u'C:\\slave\\test\\build\\firefox-44.0a1.en-US.win32.web-platform.tests.zip', 'bin/*', 'config/*', 'mozbase/*', 'marionette/*', 'web-platform/*'] in C:\slave\test\build\tests 05:00:55 INFO - Copy/paste: unzip -q -o C:\slave\test\build\firefox-44.0a1.en-US.win32.web-platform.tests.zip bin/* config/* mozbase/* marionette/* web-platform/* 05:00:55 INFO - Calling ['unzip', '-q', '-o', u'C:\\slave\\test\\build\\firefox-44.0a1.en-US.win32.web-platform.tests.zip', 'bin/*', 'config/*', 'mozbase/*', 'marionette/*', 'web-platform/*'] with output_timeout 1760 05:01:33 INFO - caution: filename not matched: bin/* 05:01:33 INFO - caution: filename not matched: config/* 05:01:33 INFO - caution: filename not matched: mozbase/* 05:01:33 INFO - caution: filename not matched: marionette/* 05:01:33 INFO - Return code: 11 05:01:33 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')]} 05:01:33 INFO - https://queue.taskcluster.net/v1/task/jxSRwR8PR_GyBpAobsIybg/artifacts/public/build/firefox-44.0a1.en-US.win32.zip matches https://queue.taskcluster.net 05:01:33 INFO - trying https://queue.taskcluster.net/v1/task/jxSRwR8PR_GyBpAobsIybg/artifacts/public/build/firefox-44.0a1.en-US.win32.zip 05:01:33 INFO - Downloading https://queue.taskcluster.net/v1/task/jxSRwR8PR_GyBpAobsIybg/artifacts/public/build/firefox-44.0a1.en-US.win32.zip to C:\slave\test\build\firefox-44.0a1.en-US.win32.zip 05:01:33 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/jxSRwR8PR_GyBpAobsIybg/artifacts/public/build/firefox-44.0a1.en-US.win32.zip', 'file_name': 'C:\\slave\\test\\build\\firefox-44.0a1.en-US.win32.zip'}, attempt #1 05:01:35 INFO - Downloaded 64608780 bytes. 05:01:35 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/jxSRwR8PR_GyBpAobsIybg/artifacts/public/build/firefox-44.0a1.en-US.win32.zip 05:01:35 INFO - mkdir: C:\slave\test\properties 05:01:35 INFO - Writing buildbot properties ['build_url'] to C:\slave\test\properties\build_url 05:01:35 INFO - Writing to file C:\slave\test\properties\build_url 05:01:35 INFO - Contents: 05:01:35 INFO - build_url:https://queue.taskcluster.net/v1/task/jxSRwR8PR_GyBpAobsIybg/artifacts/public/build/firefox-44.0a1.en-US.win32.zip 05:01:35 INFO - mkdir: C:\slave\test\build\symbols 05:01:35 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')]} 05:01:35 INFO - https://queue.taskcluster.net/v1/task/jxSRwR8PR_GyBpAobsIybg/artifacts/public/build/firefox-44.0a1.en-US.win32.crashreporter-symbols.zip matches https://queue.taskcluster.net 05:01:35 INFO - trying https://queue.taskcluster.net/v1/task/jxSRwR8PR_GyBpAobsIybg/artifacts/public/build/firefox-44.0a1.en-US.win32.crashreporter-symbols.zip 05:01:35 INFO - Downloading https://queue.taskcluster.net/v1/task/jxSRwR8PR_GyBpAobsIybg/artifacts/public/build/firefox-44.0a1.en-US.win32.crashreporter-symbols.zip to C:\slave\test\build\symbols\firefox-44.0a1.en-US.win32.crashreporter-symbols.zip 05:01:35 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/jxSRwR8PR_GyBpAobsIybg/artifacts/public/build/firefox-44.0a1.en-US.win32.crashreporter-symbols.zip', 'file_name': 'C:\\slave\\test\\build\\symbols\\firefox-44.0a1.en-US.win32.crashreporter-symbols.zip'}, attempt #1 05:01:39 INFO - Downloaded 52219177 bytes. 05:01:39 INFO - Setting buildbot property symbols_url to https://queue.taskcluster.net/v1/task/jxSRwR8PR_GyBpAobsIybg/artifacts/public/build/firefox-44.0a1.en-US.win32.crashreporter-symbols.zip 05:01:39 INFO - Writing buildbot properties ['symbols_url'] to C:\slave\test\properties\symbols_url 05:01:39 INFO - Writing to file C:\slave\test\properties\symbols_url 05:01:39 INFO - Contents: 05:01:39 INFO - symbols_url:https://queue.taskcluster.net/v1/task/jxSRwR8PR_GyBpAobsIybg/artifacts/public/build/firefox-44.0a1.en-US.win32.crashreporter-symbols.zip 05:01:39 INFO - Running command: ['unzip', '-q', 'C:\\slave\\test\\build\\symbols\\firefox-44.0a1.en-US.win32.crashreporter-symbols.zip'] in C:\slave\test\build\symbols 05:01:39 INFO - Copy/paste: unzip -q C:\slave\test\build\symbols\firefox-44.0a1.en-US.win32.crashreporter-symbols.zip 05:01:45 INFO - Return code: 0 05:01:45 INFO - Running post-action listener: _resource_record_post_action 05:01:45 INFO - Running post-action listener: set_extra_try_arguments 05:01:45 INFO - ##### 05:01:45 INFO - ##### Running create-virtualenv step. 05:01:45 INFO - ##### 05:01:45 INFO - Running pre-action listener: _pre_create_virtualenv 05:01:45 INFO - Running pre-action listener: _resource_record_pre_action 05:01:45 INFO - Running main action method: create_virtualenv 05:01:45 INFO - Creating virtualenv C:\slave\test\build\venv 05:01:45 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 05:01:45 INFO - Copy/paste: c:\mozilla-build\python27\python.exe c:/mozilla-build/buildbotve/virtualenv.py --no-site-packages --distribute C:\slave\test\build\venv 05:01:52 INFO - New python executable in C:\slave\test\build\venv\Scripts\python.exe 05:01:57 INFO - Installing distribute......................................................................................................................................................................................done. 05:01:58 INFO - Return code: 0 05:01:58 INFO - Installing psutil>=0.7.1 into virtualenv C:\slave\test\build\venv 05:01:58 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')]} 05:01:58 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:01:58 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')]} 05:01:58 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:01:58 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 0x01B226B0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x01C3D2F0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x01BE94F8>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x01BFD2C0>, '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 0x018BAD30>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x01344E80>, 'level': 'critical'}], 'cwd': 'C:\\slave\\test\\build', 'env': {'TMP': 'C:\\Users\\cltbld\\AppData\\Local\\Temp', 'MOZILLABUILD': 'D:\\mozilla-build', 'COMPUTERNAME': 'T-W732-IX-036', 'USERDOMAIN': 'T-W732-IX-036', 'KTS_VERSION': '1.19c', 'PSMODULEPATH': 'C:\\windows\\system32\\WindowsPowerShell\\v1.0\\Modules\\', 'LIBPATH': 'C:\\WINDOWS\\Microsoft.NET\\Framework\\v2.0.50727;D:\\msvs8\\VC\\ATLMFC\\LIB', 'COMMONPROGRAMFILES': 'C:\\Program Files\\Common Files', 'MOZILLABUILDPATH': '\\mozilla-build\\', 'PROCESSOR_IDENTIFIER': 'x86 Family 6 Model 30 Stepping 5, GenuineIntel', 'PROGRAMFILES': 'C:\\Program Files', 'PROCESSOR_REVISION': '1e05', 'DNSSUFFIX': 'wintest.releng.scl3.mozilla.com', 'SYSTEMROOT': 'C:\\windows', 'NO_EM_RESTART': '1', 'OURDRIVE': 'C:', 'MOZ_HIDE_RESULTS_TABLE': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MONDIR': 'C:\\Monitor_config\\', 'TEMP': 'C:\\Users\\cltbld\\AppData\\Local\\Temp', 'RUNLOGFILE': 'C:\\slave\\\\runslave.log', 'PROCESSOR_ARCHITECTURE': 'x86', 'VCVARS': 'D:\\msvs8\\VC\\bin\\vcvars32.bat', 'VSINSTALLDIR': 'D:\\msvs8', 'ALLUSERSPROFILE': 'C:\\ProgramData', 'MOZILLABUILDDRIVE': 'C:', 'LOCALAPPDATA': 'C:\\Users\\cltbld\\AppData\\Local', 'HOMEPATH': '\\Users\\cltbld', 'FRAMEWORKDIR': 'C:\\WINDOWS\\Microsoft.NET\\Framework', 'MOZBUILDDIR': 'C:\\mozilla-build\\', 'FRAMEWORKSDKDIR': 'D:\\msvs8\\SDK\\v2.0', 'TEST1': 'testie', 'LOGONSERVER': '\\\\T-W732-IX-036', 'MOZ_NO_REMOTE': '1', 'COMSPEC': 'C:\\windows\\system32\\cmd.exe', 'MSVCDIR': 'D:\\msvs8\\VC', 'PROGRAMDATA': 'C:\\ProgramData', 'MOZ_TOOLS': 'D:\\mozilla-build\\moztools', 'PATH': 'C:\\Program Files\\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:\\Program Files\\Microsoft Windows Performance Toolkit\\;c:\\mozilla-build\\hg\\;C:\\mozilla-build\\hg', 'MOZ_AIRBAG': '1', 'PROMPT': '$P$G', 'USERNAME': 'cltbld', 'NO_FAIL_ON_TEST_ERRORS': '1', 'VCINSTALLDIR': 'D:\\msvs8\\VC', 'PATHEXT': '.COM;.EXE;.BAT;.CMD;.VBS;.VBE;.JS;.JSE;.WSF;.WSH;.MSC', 'FP_NO_HOST_CHECK': 'NO', 'DCLOCATION': 'SCL3', 'WINDOWS_TRACING_LOGFILE': 'C:\\BVTBin\\Tests\\installpackage\\csilogfile.log', 'HOMEDRIVE': 'C:', 'WINDOWS_TRACING_FLAGS': '3', 'FRAMEWORKVERSION': 'v2.0.50727', 'SYSTEMDRIVE': 'C:', 'MOZ_MSVCVERSION': '8', 'SLAVEDIR': 'C:\\slave\\', 'NUMBER_OF_PROCESSORS': '8', 'APPDATA': 'C:\\Users\\cltbld\\AppData\\Roaming', 'DEVENVDIR': 'D:\\msvs8\\Common7\\IDE', 'PWD': 'C:\\slave\\test', 'PROCESSOR_LEVEL': '6', 'KTS_HOME': 'C:\\Program Files\\KTS', 'PROPERTIES_FILE': 'C:\\slave\\test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'USERPROFILE': 'C:\\Users\\cltbld', 'OS': 'Windows_NT', 'PUBLIC': 'C:\\Users\\Public', 'WINDIR': 'C:\\windows'}}, attempt #1 05:01:58 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 05:01:58 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 05:01:58 INFO - Using env: {'ALLUSERSPROFILE': 'C:\\ProgramData', 05:01:58 INFO - 'APPDATA': 'C:\\Users\\cltbld\\AppData\\Roaming', 05:01:58 INFO - 'COMMONPROGRAMFILES': 'C:\\Program Files\\Common Files', 05:01:58 INFO - 'COMPUTERNAME': 'T-W732-IX-036', 05:01:58 INFO - 'COMSPEC': 'C:\\windows\\system32\\cmd.exe', 05:01:58 INFO - 'DCLOCATION': 'SCL3', 05:01:58 INFO - 'DEVENVDIR': 'D:\\msvs8\\Common7\\IDE', 05:01:58 INFO - 'DNSSUFFIX': 'wintest.releng.scl3.mozilla.com', 05:01:58 INFO - 'FP_NO_HOST_CHECK': 'NO', 05:01:58 INFO - 'FRAMEWORKDIR': 'C:\\WINDOWS\\Microsoft.NET\\Framework', 05:01:58 INFO - 'FRAMEWORKSDKDIR': 'D:\\msvs8\\SDK\\v2.0', 05:01:58 INFO - 'FRAMEWORKVERSION': 'v2.0.50727', 05:01:58 INFO - 'HOMEDRIVE': 'C:', 05:01:58 INFO - 'HOMEPATH': '\\Users\\cltbld', 05:01:58 INFO - 'KTS_HOME': 'C:\\Program Files\\KTS', 05:01:58 INFO - 'KTS_VERSION': '1.19c', 05:01:58 INFO - 'LIBPATH': 'C:\\WINDOWS\\Microsoft.NET\\Framework\\v2.0.50727;D:\\msvs8\\VC\\ATLMFC\\LIB', 05:01:58 INFO - 'LOCALAPPDATA': 'C:\\Users\\cltbld\\AppData\\Local', 05:01:58 INFO - 'LOGONSERVER': '\\\\T-W732-IX-036', 05:01:58 INFO - 'MONDIR': 'C:\\Monitor_config\\', 05:01:58 INFO - 'MOZBUILDDIR': 'C:\\mozilla-build\\', 05:01:58 INFO - 'MOZILLABUILD': 'D:\\mozilla-build', 05:01:58 INFO - 'MOZILLABUILDDRIVE': 'C:', 05:01:58 INFO - 'MOZILLABUILDPATH': '\\mozilla-build\\', 05:01:58 INFO - 'MOZ_AIRBAG': '1', 05:01:58 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:01:58 INFO - 'MOZ_HIDE_RESULTS_TABLE': '1', 05:01:58 INFO - 'MOZ_MSVCVERSION': '8', 05:01:58 INFO - 'MOZ_NO_REMOTE': '1', 05:01:58 INFO - 'MOZ_TOOLS': 'D:\\mozilla-build\\moztools', 05:01:58 INFO - 'MSVCDIR': 'D:\\msvs8\\VC', 05:01:58 INFO - 'NO_EM_RESTART': '1', 05:01:58 INFO - 'NO_FAIL_ON_TEST_ERRORS': '1', 05:01:58 INFO - 'NUMBER_OF_PROCESSORS': '8', 05:01:58 INFO - 'OS': 'Windows_NT', 05:01:58 INFO - 'OURDRIVE': 'C:', 05:01:58 INFO - 'PATH': 'C:\\Program Files\\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:\\Program Files\\Microsoft Windows Performance Toolkit\\;c:\\mozilla-build\\hg\\;C:\\mozilla-build\\hg', 05:01:58 INFO - 'PATHEXT': '.COM;.EXE;.BAT;.CMD;.VBS;.VBE;.JS;.JSE;.WSF;.WSH;.MSC', 05:01:58 INFO - 'PROCESSOR_ARCHITECTURE': 'x86', 05:01:58 INFO - 'PROCESSOR_IDENTIFIER': 'x86 Family 6 Model 30 Stepping 5, GenuineIntel', 05:01:58 INFO - 'PROCESSOR_LEVEL': '6', 05:01:58 INFO - 'PROCESSOR_REVISION': '1e05', 05:01:58 INFO - 'PROGRAMDATA': 'C:\\ProgramData', 05:01:58 INFO - 'PROGRAMFILES': 'C:\\Program Files', 05:01:58 INFO - 'PROMPT': '$P$G', 05:01:58 INFO - 'PROPERTIES_FILE': 'C:\\slave\\test/buildprops.json', 05:01:58 INFO - 'PSMODULEPATH': 'C:\\windows\\system32\\WindowsPowerShell\\v1.0\\Modules\\', 05:01:58 INFO - 'PUBLIC': 'C:\\Users\\Public', 05:01:58 INFO - 'PWD': 'C:\\slave\\test', 05:01:58 INFO - 'RUNLOGFILE': 'C:\\slave\\\\runslave.log', 05:01:58 INFO - 'SLAVEDIR': 'C:\\slave\\', 05:01:58 INFO - 'SYSTEMDRIVE': 'C:', 05:01:58 INFO - 'SYSTEMROOT': 'C:\\windows', 05:01:58 INFO - 'TEMP': 'C:\\Users\\cltbld\\AppData\\Local\\Temp', 05:01:58 INFO - 'TEST1': 'testie', 05:01:58 INFO - 'TMP': 'C:\\Users\\cltbld\\AppData\\Local\\Temp', 05:01:58 INFO - 'USERDOMAIN': 'T-W732-IX-036', 05:01:58 INFO - 'USERNAME': 'cltbld', 05:01:58 INFO - 'USERPROFILE': 'C:\\Users\\cltbld', 05:01:58 INFO - 'VCINSTALLDIR': 'D:\\msvs8\\VC', 05:01:58 INFO - 'VCVARS': 'D:\\msvs8\\VC\\bin\\vcvars32.bat', 05:01:58 INFO - 'VSINSTALLDIR': 'D:\\msvs8', 05:01:58 INFO - 'WINDIR': 'C:\\windows', 05:01:58 INFO - 'WINDOWS_TRACING_FLAGS': '3', 05:01:58 INFO - 'WINDOWS_TRACING_LOGFILE': 'C:\\BVTBin\\Tests\\installpackage\\csilogfile.log', 05:01:58 INFO - 'XPCOM_DEBUG_BREAK': 'warn'} 05:02:00 INFO - Ignoring indexes: http://pypi.python.org/simple/ 05:02:00 INFO - Downloading/unpacking psutil>=0.7.1 05:02:00 INFO - Creating supposed download cache at C:\slave\test\build\venv\cache 05:02:00 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.tar.gz 05:02:00 INFO - Running setup.py egg_info for package psutil 05:02:00 INFO - warning: no previously-included files matching '*' found under directory 'docs\_build' 05:02:00 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects