builder: graphics_win8_64_test-dromaeojs slave: t-w864-ix-370 starttime: 1479847823.76 results: success (0) buildid: 20161122113650 builduid: f73688ebcd404696896c5ac2efeb46d0 revision: 4cf8741bb86f96dcb62dc98594f109e7ed2733a1 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-11-22 12:50:23.760503) ========= master: http://buildbot-master110.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-11-22 12:50:23.760950) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-11-22 12:50:23.761394) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-11-22 12:50:23.861070) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2016-11-22 12:50:23.861394) ========= '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-370\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-370 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-370 KTS_HOME=C:\Program Files\KTS KTS_VERSION=1.19c LOCALAPPDATA=C:\Users\cltbld.T-W864-IX-370\AppData\Local LOGONSERVER=\\T-W864-IX-370 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-370 USERDOMAIN_ROAMINGPROFILE=T-W864-IX-370 USERNAME=cltbld USERPROFILE=C:\Users\cltbld.T-W864-IX-370 WINDIR=C:\windows XPCOM_DEBUG_BREAK=warn using PTY: False --12:50:24-- 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. WARNING: Certificate verification error for hg.mozilla.org: certificate signature failure HTTP request sent, awaiting response... 200 Script output follows Length: 12,179 (12K) [text/x-python] 0K .......... . 100% 9.07 MB/s 12:50:24 (9.07 MB/s) - `archiver_client.py' saved [12179/12179] program finished with exit code 0 elapsedTime=1.783000 ========= master_lag: 0.06 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2016-11-22 12:50:25.700180) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 3 secs) (at 2016-11-22 12:50:25.700725) ========= 'rm' '-rf' 'scripts' 'properties' in dir C:\slave\test\. (timeout 1200 secs) watching logfiles {} argv: ['rm', '-rf', 'scripts', 'properties'] environment: ALLUSERSPROFILE=C:\ProgramData APPDATA=C:\Users\cltbld.T-W864-IX-370\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-370 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-370 KTS_HOME=C:\Program Files\KTS KTS_VERSION=1.19c LOCALAPPDATA=C:\Users\cltbld.T-W864-IX-370\AppData\Local LOGONSERVER=\\T-W864-IX-370 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-370 USERDOMAIN_ROAMINGPROFILE=T-W864-IX-370 USERNAME=cltbld USERPROFILE=C:\Users\cltbld.T-W864-IX-370 WINDIR=C:\windows XPCOM_DEBUG_BREAK=warn using PTY: False program finished with exit code 0 elapsedTime=3.213000 ========= master_lag: 0.02 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 3 secs) (at 2016-11-22 12:50:28.930242) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 2 secs) (at 2016-11-22 12:50:28.930589) ========= 'bash' '-c' u'python archiver_client.py mozharness --repo projects/graphics --rev 4cf8741bb86f96dcb62dc98594f109e7ed2733a1 --destination scripts --debug' in dir C:\slave\test\. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', u'python archiver_client.py mozharness --repo projects/graphics --rev 4cf8741bb86f96dcb62dc98594f109e7ed2733a1 --destination scripts --debug'] environment: ALLUSERSPROFILE=C:\ProgramData APPDATA=C:\Users\cltbld.T-W864-IX-370\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-370 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-370 KTS_HOME=C:\Program Files\KTS KTS_VERSION=1.19c LOCALAPPDATA=C:\Users\cltbld.T-W864-IX-370\AppData\Local LOGONSERVER=\\T-W864-IX-370 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-370 USERDOMAIN_ROAMINGPROFILE=T-W864-IX-370 USERNAME=cltbld USERPROFILE=C:\Users\cltbld.T-W864-IX-370 WINDIR=C:\windows XPCOM_DEBUG_BREAK=warn using PTY: False 2016-11-22 12:50:28,538 truncating revision to first 12 chars 2016-11-22 12:50:28,538 Setting DEBUG logging. 2016-11-22 12:50:28,538 attempt 1/10 2016-11-22 12:50:28,539 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/projects/graphics/4cf8741bb86f?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-11-22 12:50:29,973 unpacking tar archive at: graphics-4cf8741bb86f/testing/mozharness/ 2016-11-22 12:50:30,076 skipping symlink on windows: configs/single_locale/linux32.py program finished with exit code 0 elapsedTime=2.033000 ========= master_lag: 0.05 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 2 secs) (at 2016-11-22 12:50:31.018488) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-11-22 12:50:31.018794) ========= script_repo_revision: 4cf8741bb86f96dcb62dc98594f109e7ed2733a1 ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-11-22 12:50:31.019215) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-11-22 12:50:31.019498) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-11-22 12:50:31.040355) ========= ========= Started 'c:/mozilla-build/python27/python -u ...' (results: 0, elapsed: 23 mins, 3 secs) (at 2016-11-22 12:50:31.040687) ========= 'c:/mozilla-build/python27/python' '-u' 'scripts/scripts/talos_script.py' '--suite' 'dromaeojs' '--add-option' '--webServer,localhost' '--branch-name' 'Graphics' '--cfg' 'talos/windows_config.py' '--download-symbols' 'ondemand' '--use-talos-json' '--blob-upload-branch' 'Graphics' 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', 'Graphics', '--cfg', 'talos/windows_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Graphics'] environment: ALLUSERSPROFILE=C:\ProgramData APPDATA=C:\Users\cltbld.T-W864-IX-370\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-370 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-370 KTS_HOME=C:\Program Files\KTS KTS_VERSION=1.19c LOCALAPPDATA=C:\Users\cltbld.T-W864-IX-370\AppData\Local LOGONSERVER=\\T-W864-IX-370 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-370 USERDOMAIN_ROAMINGPROFILE=T-W864-IX-370 USERNAME=cltbld USERPROFILE=C:\Users\cltbld.T-W864-IX-370 WINDIR=C:\windows XPCOM_DEBUG_BREAK=warn using PTY: False 12:50:30 INFO - MultiFileLogger online at 20161122 12:50:30 in C:\slave\test 12:50:30 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Graphics --cfg talos/windows_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Graphics 12:50:30 INFO - Dumping config to C:\slave\test\logs\localconfig.json. 12:50:30 INFO - {'append_to_log': False, 12:50:30 INFO - 'base_work_dir': 'C:\\slave\\test', 12:50:30 INFO - 'blob_upload_branch': 'Graphics', 12:50:30 INFO - 'blob_uploader_auth_file': 'C:\\slave\\test\\oauth.txt', 12:50:30 INFO - 'branch': 'Graphics', 12:50:30 INFO - 'buildbot_json_path': 'buildprops.json', 12:50:30 INFO - 'config_files': ('talos/windows_config.py',), 12:50:30 INFO - 'default_actions': ('clobber', 12:50:30 INFO - 'read-buildbot-config', 12:50:30 INFO - 'download-and-extract', 12:50:30 INFO - 'populate-webroot', 12:50:30 INFO - 'create-virtualenv', 12:50:30 INFO - 'install', 12:50:30 INFO - 'run-tests'), 12:50:30 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 12:50:30 INFO - 'download_minidump_stackwalk': True, 12:50:30 INFO - 'download_symbols': 'ondemand', 12:50:30 INFO - 'exes': {'easy_install': ('C:\\slave\\test\\build/venv/scripts/python', 12:50:30 INFO - 'C:\\slave\\test\\build/venv/scripts/easy_install-2.7-script.py'), 12:50:30 INFO - 'hg': 'c:/mozilla-build/hg/hg', 12:50:30 INFO - 'mozinstall': ('C:\\slave\\test\\build/venv/scripts/python', 12:50:30 INFO - 'C:\\slave\\test\\build/venv/scripts/mozinstall-script.py'), 12:50:30 INFO - 'python': 'c:/mozilla-build/python27/python.exe', 12:50:30 INFO - 'tooltool.py': ('c:/mozilla-build/python27/python.exe', 12:50:30 INFO - 'C:/mozilla-build/tooltool.py'), 12:50:30 INFO - 'virtualenv': ('c:/mozilla-build/python27/python.exe', 12:50:30 INFO - 'c:/mozilla-build/buildbotve/virtualenv.py')}, 12:50:30 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 12:50:30 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 12:50:30 INFO - 'installer_path': 'installer.exe', 12:50:30 INFO - 'log_level': 'info', 12:50:30 INFO - 'log_name': 'talos', 12:50:30 INFO - 'log_to_console': True, 12:50:30 INFO - 'metro_harness_path_frmt': '%(metro_base_path)s/metro/metrotestharness.exe', 12:50:30 INFO - 'minidump_stackwalk_path': 'win32-minidump_stackwalk.exe', 12:50:30 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/win32/releng.manifest', 12:50:30 INFO - 'opt_config_files': (), 12:50:30 INFO - 'pip_index': False, 12:50:30 INFO - 'sps_profile': False, 12:50:30 INFO - 'sps_profile_interval': 0, 12:50:30 INFO - 'suite': 'dromaeojs', 12:50:30 INFO - 'system_bits': '32', 12:50:30 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 12:50:30 INFO - 'title': 'T-W864-IX-370', 12:50:30 INFO - 'use_talos_json': True, 12:50:30 INFO - 'virtualenv_modules': ('pywin32', 'talos', 'mozinstall'), 12:50:30 INFO - 'virtualenv_path': 'C:\\slave\\test\\build/venv', 12:50:30 INFO - 'virtualenv_python_dll': 'c:/mozilla-build/python27/python27.dll', 12:50:30 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 12:50:30 INFO - 'work_dir': 'build'} 12:50:30 INFO - [mozharness: 2016-11-22 20:50:30.836000Z] Running clobber step. 12:50:30 INFO - Running pre-action listener: _resource_record_pre_action 12:50:30 INFO - Running main action method: clobber 12:50:30 INFO - rmtree: C:\slave\test\build 12:50:30 INFO - Using _rmtree_windows ... 12:50:30 INFO - retry: Calling _rmtree_windows with args: ('C:\\slave\\test\\build',), kwargs: {}, attempt #1 12:51:58 INFO - Running post-action listener: _resource_record_post_action 12:51:58 INFO - [mozharness: 2016-11-22 20:51:58.315000Z] Finished clobber step (success) 12:51:58 INFO - [mozharness: 2016-11-22 20:51:58.315000Z] Running read-buildbot-config step. 12:51:58 INFO - Running pre-action listener: _resource_record_pre_action 12:51:58 INFO - Running main action method: read_buildbot_config 12:51:58 INFO - Using buildbot properties: 12:51:58 INFO - { 12:51:58 INFO - "project": "", 12:51:58 INFO - "product": "firefox", 12:51:58 INFO - "script_repo_revision": "default", 12:51:58 INFO - "builddir": "graphics_win8_64_test-dromaeojs", 12:51:58 INFO - "repository": "", 12:51:58 INFO - "buildername": "Windows 8 64-bit graphics talos dromaeojs", 12:51:58 INFO - "buildid": "20161122113650", 12:51:58 INFO - "pgo_build": "False", 12:51:58 INFO - "basedir": "C:\\slave\\test", 12:51:58 INFO - "buildnumber": 3, 12:51:58 INFO - "slavename": "t-w864-ix-370", 12:51:58 INFO - "master": "http://buildbot-master110.bb.releng.scl3.mozilla.com:8201/", 12:51:58 INFO - "platform": "win8_64", 12:51:58 INFO - "scheduler": "tests-graphics-win64-talos", 12:51:58 INFO - "branch": "graphics", 12:51:58 INFO - "repo_path": "projects/graphics", 12:51:58 INFO - "revision": "4cf8741bb86f96dcb62dc98594f109e7ed2733a1", 12:51:58 INFO - "stage_platform": "win64", 12:51:58 INFO - "builduid": "f73688ebcd404696896c5ac2efeb46d0", 12:51:58 INFO - "slavebuilddir": "test" 12:51:58 INFO - } 12:51:58 INFO - Found installer url https://queue.taskcluster.net/v1/task/WfBlHjtkQWqKdJi7pskhXA/artifacts/public/build/firefox-53.0a1.en-US.win64.zip. 12:51:58 INFO - Running post-action listener: _resource_record_post_action 12:51:58 INFO - [mozharness: 2016-11-22 20:51:58.318000Z] Finished read-buildbot-config step (success) 12:51:58 INFO - [mozharness: 2016-11-22 20:51:58.318000Z] Running download-and-extract step. 12:51:58 INFO - Running pre-action listener: _resource_record_pre_action 12:51:58 INFO - Running main action method: download_and_extract 12:51:58 INFO - mkdir: C:\slave\test\build\tests 12:51: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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 12:51:58 INFO - trying https://queue.taskcluster.net/v1/task/WfBlHjtkQWqKdJi7pskhXA/artifacts/public/build/firefox-53.0a1.en-US.win64.test_packages.json 12:51:58 INFO - Downloading https://queue.taskcluster.net/v1/task/WfBlHjtkQWqKdJi7pskhXA/artifacts/public/build/firefox-53.0a1.en-US.win64.test_packages.json to C:\slave\test\build\firefox-53.0a1.en-US.win64.test_packages.json 12:51:58 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/WfBlHjtkQWqKdJi7pskhXA/artifacts/public/build/firefox-53.0a1.en-US.win64.test_packages.json', 'file_name': 'C:\\slave\\test\\build\\firefox-53.0a1.en-US.win64.test_packages.json'}, attempt #1 12:51:59 INFO - Downloaded 1274 bytes. 12:51:59 INFO - Reading from file C:\slave\test\build\firefox-53.0a1.en-US.win64.test_packages.json 12:51:59 INFO - Using the following test package requirements: 12:51:59 INFO - {u'common': [u'firefox-53.0a1.en-US.win64.common.tests.zip'], 12:51:59 INFO - u'cppunittest': [u'firefox-53.0a1.en-US.win64.common.tests.zip', 12:51:59 INFO - u'firefox-53.0a1.en-US.win64.cppunittest.tests.zip'], 12:51:59 INFO - u'gtest': [u'firefox-53.0a1.en-US.win64.common.tests.zip', 12:51:59 INFO - u'firefox-53.0a1.en-US.win64.gtest.tests.zip'], 12:51:59 INFO - u'jittest': [u'firefox-53.0a1.en-US.win64.common.tests.zip', 12:51:59 INFO - u'jsshell-win64.zip'], 12:51:59 INFO - u'mochitest': [u'firefox-53.0a1.en-US.win64.common.tests.zip', 12:51:59 INFO - u'firefox-53.0a1.en-US.win64.mochitest.tests.zip'], 12:51:59 INFO - u'mozbase': [u'firefox-53.0a1.en-US.win64.common.tests.zip'], 12:51:59 INFO - u'reftest': [u'firefox-53.0a1.en-US.win64.common.tests.zip', 12:51:59 INFO - u'firefox-53.0a1.en-US.win64.reftest.tests.zip'], 12:51:59 INFO - u'talos': [u'firefox-53.0a1.en-US.win64.common.tests.zip', 12:51:59 INFO - u'firefox-53.0a1.en-US.win64.talos.tests.zip'], 12:51:59 INFO - u'web-platform': [u'firefox-53.0a1.en-US.win64.common.tests.zip', 12:51:59 INFO - u'firefox-53.0a1.en-US.win64.web-platform.tests.zip'], 12:51:59 INFO - u'xpcshell': [u'firefox-53.0a1.en-US.win64.common.tests.zip', 12:51:59 INFO - u'firefox-53.0a1.en-US.win64.xpcshell.tests.zip']} 12:51:59 INFO - Downloading packages: [u'firefox-53.0a1.en-US.win64.common.tests.zip'] for test suite category: common 12:51:59 INFO - Downloading and extracting to C:\slave\test\build\tests these dirs * from https://queue.taskcluster.net/v1/task/WfBlHjtkQWqKdJi7pskhXA/artifacts/public/build/firefox-53.0a1.en-US.win64.common.tests.zip 12:51:59 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/WfBlHjtkQWqKdJi7pskhXA/artifacts/public/build/firefox-53.0a1.en-US.win64.common.tests.zip'}, attempt #1 12:51:59 INFO - Fetch https://queue.taskcluster.net/v1/task/WfBlHjtkQWqKdJi7pskhXA/artifacts/public/build/firefox-53.0a1.en-US.win64.common.tests.zip into memory 12:51:59 INFO - Http code: 200 12:51:59 INFO - via: 1.1 f1a40337a32137e1c23ceffead6a50d5.cloudfront.net (CloudFront) 12:51:59 INFO - x-amz-cf-id: b0xwucAU56ErvLBywXxQzP29u5PNB3YquJTvX_UKF9bcyKFRtUT-yg== 12:51:59 INFO - x-amz-version-id: gYN4ip7f192gqDANUvyMqonD1J6zz5Ar 12:52:00 INFO - Expected file size: 17129252 12:52:00 INFO - Obtained file size: 17129252 12:52:19 INFO - Downloading packages: [u'firefox-53.0a1.en-US.win64.common.tests.zip', u'firefox-53.0a1.en-US.win64.talos.tests.zip'] for test suite category: talos 12:52:19 INFO - Downloading and extracting to C:\slave\test\build\tests these dirs * from https://queue.taskcluster.net/v1/task/WfBlHjtkQWqKdJi7pskhXA/artifacts/public/build/firefox-53.0a1.en-US.win64.common.tests.zip 12:52:19 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/WfBlHjtkQWqKdJi7pskhXA/artifacts/public/build/firefox-53.0a1.en-US.win64.common.tests.zip'}, attempt #1 12:52:19 INFO - Fetch https://queue.taskcluster.net/v1/task/WfBlHjtkQWqKdJi7pskhXA/artifacts/public/build/firefox-53.0a1.en-US.win64.common.tests.zip into memory 12:52:19 INFO - Http code: 200 12:52:19 INFO - via: 1.1 b3bccc0e4c2cc0a33e7e8308d88cacdd.cloudfront.net (CloudFront) 12:52:19 INFO - x-amz-cf-id: 23pBAt7hxCrgeJwJO1RwMpNwdBVi8WMbUqZr27h0iJsyYMmLbOlqDQ== 12:52:19 INFO - x-amz-version-id: gYN4ip7f192gqDANUvyMqonD1J6zz5Ar 12:52:20 INFO - Expected file size: 17129252 12:52:20 INFO - Obtained file size: 17129252 12:52:28 INFO - Downloading and extracting to C:\slave\test\build\tests these dirs * from https://queue.taskcluster.net/v1/task/WfBlHjtkQWqKdJi7pskhXA/artifacts/public/build/firefox-53.0a1.en-US.win64.talos.tests.zip 12:52:28 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/WfBlHjtkQWqKdJi7pskhXA/artifacts/public/build/firefox-53.0a1.en-US.win64.talos.tests.zip'}, attempt #1 12:52:28 INFO - Fetch https://queue.taskcluster.net/v1/task/WfBlHjtkQWqKdJi7pskhXA/artifacts/public/build/firefox-53.0a1.en-US.win64.talos.tests.zip into memory 12:52:29 INFO - Http code: 200 12:52:29 INFO - via: 1.1 bb8a7ff26b131d51953dc2d3e19a2751.cloudfront.net (CloudFront) 12:52:29 INFO - x-amz-cf-id: gOCZl3jko6VVL4qPrYkdDqW4Qq09YboIpXw3ML0S541J5ELWFk01Qw== 12:52:29 INFO - x-amz-version-id: TRWVrfhj.81vyQl_3DXTrdZogRzk8bw1 12:52:29 INFO - Expected file size: 14409392 12:52:29 INFO - Obtained file size: 14409392 12:52: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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 12:52:35 INFO - trying https://queue.taskcluster.net/v1/task/WfBlHjtkQWqKdJi7pskhXA/artifacts/public/build/firefox-53.0a1.en-US.win64.zip 12:52:35 INFO - Downloading https://queue.taskcluster.net/v1/task/WfBlHjtkQWqKdJi7pskhXA/artifacts/public/build/firefox-53.0a1.en-US.win64.zip to C:\slave\test\build\firefox-53.0a1.en-US.win64.zip 12:52:35 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/WfBlHjtkQWqKdJi7pskhXA/artifacts/public/build/firefox-53.0a1.en-US.win64.zip', 'file_name': 'C:\\slave\\test\\build\\firefox-53.0a1.en-US.win64.zip'}, attempt #1 12:52:36 INFO - Downloaded 57294831 bytes. 12:52:36 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/WfBlHjtkQWqKdJi7pskhXA/artifacts/public/build/firefox-53.0a1.en-US.win64.zip 12:52:36 INFO - mkdir: C:\slave\test\properties 12:52:36 INFO - Writing buildbot properties ['build_url'] to C:\slave\test\properties\build_url 12:52:36 INFO - Writing to file C:\slave\test\properties\build_url 12:52:36 INFO - Contents: 12:52:36 INFO - build_url:https://queue.taskcluster.net/v1/task/WfBlHjtkQWqKdJi7pskhXA/artifacts/public/build/firefox-53.0a1.en-US.win64.zip 12:52:37 INFO - Running post-action listener: _resource_record_post_action 12:52:37 INFO - Running post-action listener: set_extra_try_arguments 12:52:37 INFO - [mozharness: 2016-11-22 20:52:37.238000Z] Finished download-and-extract step (success) 12:52:37 INFO - [mozharness: 2016-11-22 20:52:37.238000Z] Running populate-webroot step. 12:52:37 INFO - Running pre-action listener: _resource_record_pre_action 12:52:37 INFO - Running main action method: populate_webroot 12:52:37 INFO - {u'extra_options': {u'android': [u'--apkPath=%(apk_path)s']}, 12:52:37 INFO - u'mobile-suites': {u'remote-tp4m_nochrome': {u'tests': [u'tp4m']}, 12:52:37 INFO - u'remote-tsvgx': {u'talos_options': [u'--noChrome', 12:52:37 INFO - u'--tppagecycles', 12:52:37 INFO - u'7'], 12:52:37 INFO - u'tests': [u'tsvgm']}}, 12:52:37 INFO - u'suites': {u'chromez': {u'talos_options': [u'--disable-e10s'], 12:52:37 INFO - u'tests': [u'tresize', u'tcanvasmark']}, 12:52:37 INFO - u'chromez-e10s': {u'tests': [u'tresize', u'tcanvasmark']}, 12:52:37 INFO - u'dromaeojs': {u'talos_options': [u'--disable-e10s'], 12:52:37 INFO - u'tests': [u'dromaeo_css', u'kraken']}, 12:52:37 INFO - u'dromaeojs-e10s': {u'tests': [u'dromaeo_css', u'kraken']}, 12:52:37 INFO - u'g1': {u'pagesets_name': u'tp5n.zip', 12:52:37 INFO - u'talos_options': [u'--disable-e10s'], 12:52:37 INFO - u'tests': [u'tp5o_scroll', u'glterrain']}, 12:52:37 INFO - u'g1-e10s': {u'pagesets_name': u'tp5n.zip', 12:52:37 INFO - u'tests': [u'tp5o_scroll', u'glterrain']}, 12:52:37 INFO - u'g2': {u'pagesets_name': u'tp5n.zip', 12:52:37 INFO - u'talos_options': [u'--disable-e10s'], 12:52:37 INFO - u'tests': [u'damp', u'tps']}, 12:52:37 INFO - u'g2-e10s': {u'pagesets_name': u'tp5n.zip', 12:52:37 INFO - u'tests': [u'damp', u'tps']}, 12:52:37 INFO - u'g3': {u'talos_options': [u'--disable-e10s'], 12:52:37 INFO - u'tests': [u'dromaeo_dom']}, 12:52:37 INFO - u'g3-e10s': {u'tests': [u'dromaeo_dom']}, 12:52:37 INFO - u'g4': {u'talos_options': [u'--disable-e10s'], 12:52:37 INFO - u'tests': [u'basic_compositor_video']}, 12:52:37 INFO - u'g4-e10s': {u'tests': [u'basic_compositor_video']}, 12:52:37 INFO - u'other': {u'talos_options': [u'--disable-e10s'], 12:52:37 INFO - u'tests': [u'a11yr', 12:52:37 INFO - u'ts_paint', 12:52:37 INFO - u'tpaint', 12:52:37 INFO - u'sessionrestore', 12:52:37 INFO - u'sessionrestore_no_auto_restore', 12:52:37 INFO - u'tabpaint']}, 12:52:37 INFO - u'other-e10s': {u'tests': [u'a11yr', 12:52:37 INFO - u'ts_paint', 12:52:37 INFO - u'tpaint', 12:52:37 INFO - u'sessionrestore', 12:52:37 INFO - u'sessionrestore_no_auto_restore', 12:52:37 INFO - u'tabpaint']}, 12:52:37 INFO - u'other-e10s_l64': {u'tests': [u'a11yr', 12:52:37 INFO - u'ts_paint', 12:52:37 INFO - u'tpaint', 12:52:37 INFO - u'sessionrestore', 12:52:37 INFO - u'sessionrestore_no_auto_restore', 12:52:37 INFO - u'tabpaint']}, 12:52:37 INFO - u'other-e10s_nol64': {u'tests': [u'a11yr', 12:52:37 INFO - u'ts_paint', 12:52:37 INFO - u'tpaint', 12:52:37 INFO - u'sessionrestore', 12:52:37 INFO - u'sessionrestore_no_auto_restore', 12:52:37 INFO - u'tabpaint']}, 12:52:37 INFO - u'other_l64': {u'talos_options': [u'--disable-e10s'], 12:52:37 INFO - u'tests': [u'a11yr', 12:52:37 INFO - u'ts_paint', 12:52:37 INFO - u'tpaint', 12:52:37 INFO - u'sessionrestore', 12:52:37 INFO - u'sessionrestore_no_auto_restore', 12:52:37 INFO - u'tabpaint']}, 12:52:37 INFO - u'other_nol64': {u'talos_options': [u'--disable-e10s'], 12:52:37 INFO - u'tests': [u'a11yr', 12:52:37 INFO - u'ts_paint', 12:52:37 INFO - u'tpaint', 12:52:37 INFO - u'sessionrestore', 12:52:37 INFO - u'sessionrestore_no_auto_restore', 12:52:37 INFO - u'tabpaint']}, 12:52:37 INFO - u'svgr': {u'talos_options': [u'--disable-e10s'], 12:52:37 INFO - u'tests': [u'tsvgx', 12:52:37 INFO - u'tsvgr_opacity', 12:52:37 INFO - u'tart', 12:52:37 INFO - u'tscrollx', 12:52:37 INFO - u'cart']}, 12:52:37 INFO - u'svgr-e10s': {u'tests': [u'tsvgx', 12:52:37 INFO - u'tsvgr_opacity', 12:52:37 INFO - u'tart', 12:52:37 INFO - u'tscrollx', 12:52:37 INFO - u'cart']}, 12:52:37 INFO - u'tp5o': {u'pagesets_name': u'tp5n.zip', 12:52:37 INFO - u'talos_options': [u'--disable-e10s'], 12:52:37 INFO - u'tests': [u'tp5o']}, 12:52:37 INFO - u'tp5o-e10s': {u'pagesets_name': u'tp5n.zip', 12:52:37 INFO - u'tests': [u'tp5o']}, 12:52:37 INFO - u'xperf': {u'pagesets_name': u'tp5n.zip', 12:52:37 INFO - u'talos_options': [u'--disable-e10s', 12:52:37 INFO - u'--xperf_path', 12:52:37 INFO - u'"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 12:52:37 INFO - u'tests': [u'tp5n']}, 12:52:37 INFO - u'xperf-e10s': {u'pagesets_name': u'tp5n.zip', 12:52:37 INFO - u'talos_options': [u'--xperf_path', 12:52:37 INFO - u'"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 12:52:37 INFO - u'tests': [u'tp5n']}}, 12:52:37 INFO - u'talos.zip': {u'path': u'', 12:52:37 INFO - u'url': u'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 12:52:37 INFO - Running post-action listener: _resource_record_post_action 12:52:37 INFO - [mozharness: 2016-11-22 20:52:37.280000Z] Finished populate-webroot step (success) 12:52:37 INFO - [mozharness: 2016-11-22 20:52:37.280000Z] Running create-virtualenv step. 12:52:37 INFO - Running pre-action listener: _resource_record_pre_action 12:52:37 INFO - Running main action method: create_virtualenv 12:52:37 INFO - Creating virtualenv C:\slave\test\build/venv 12:52:37 INFO - mkdir: C:\slave\test\build\venv\Scripts 12:52:37 INFO - Copying c:/mozilla-build/python27/python27.dll to C:\slave\test\build\venv\Scripts\python27.dll 12:52:37 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'! 12:52:37 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 12:52:37 INFO - Copy/paste: c:/mozilla-build/python27/python.exe c:/mozilla-build/buildbotve/virtualenv.py --no-site-packages --distribute C:\slave\test\build/venv 12:52:43 INFO - New python executable in C:\slave\test\build/venv\Scripts\python.exe 12:52:46 INFO - Installing distribute......................................................................................................................................................................................done. 12:52:48 INFO - Return code: 0 12:52:48 INFO - Getting output from command: ['C:\\slave\\test\\build\\venv\\Scripts\\pip', '--version'] 12:52:48 INFO - Copy/paste: C:\slave\test\build\venv\Scripts\pip --version 12:52:48 INFO - Reading from file tmpfile_stdout 12:52:48 INFO - Output received: 12:52:48 INFO - pip 0.8.2 from c:\slave\test\build\venv\lib\site-packages\pip-0.8.2-py2.7.egg (python 2.7) 12:52:48 INFO - Using _rmtree_windows ... 12:52:48 INFO - Using _rmtree_windows ... 12:52:48 INFO - Installing pip>=1.5 into virtualenv C:\slave\test\build/venv 12:52: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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 12:52:48 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 12:52: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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 12:52:48 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 12:52:48 INFO - retry: Calling run_command with args: [['C:\\slave\\test\\build\\venv\\Scripts\\pip', 'install', '--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 0x021ED640>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x02797020>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x01D00808>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x022B5E90>, '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 0x01C6A910>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x027765C0>, 'level': 'critical'}], 'cwd': 'C:\\slave\\test\\build', 'env': {'TMP': 'C:\\Users\\CLTBLD~1.T-W\\AppData\\Local\\Temp', 'TEST1': 'testie', 'COMPUTERNAME': 'T-W864-IX-370', 'USERDOMAIN': 'T-W864-IX-370', '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-370', 'LOCALAPPDATA': 'C:\\Users\\cltbld.T-W864-IX-370\\AppData\\Local', 'HOMEPATH': '\\Users\\cltbld.T-W864-IX-370', 'USERDOMAIN_ROAMINGPROFILE': 'T-W864-IX-370', 'MOZBUILDDIR': 'C:\\mozilla-build\\', 'PROGRAMW6432': 'C:\\Program Files', 'USERNAME': 'cltbld', 'LOGONSERVER': '\\\\T-W864-IX-370', '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-370\\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 12:52:48 INFO - Running command: ['C:\\slave\\test\\build\\venv\\Scripts\\pip', 'install', '--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 12:52:48 INFO - Copy/paste: C:\slave\test\build\venv\Scripts\pip install --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 12:52:48 INFO - Using env: {'ALLUSERSPROFILE': 'C:\\ProgramData', 12:52:48 INFO - 'APPDATA': 'C:\\Users\\cltbld.T-W864-IX-370\\AppData\\Roaming', 12:52:48 INFO - 'COMMONPROGRAMFILES': 'C:\\Program Files (x86)\\Common Files', 12:52:48 INFO - 'COMMONPROGRAMFILES(X86)': 'C:\\Program Files (x86)\\Common Files', 12:52:48 INFO - 'COMMONPROGRAMW6432': 'C:\\Program Files\\Common Files', 12:52:48 INFO - 'COMPUTERNAME': 'T-W864-IX-370', 12:52:48 INFO - 'COMSPEC': 'C:\\windows\\system32\\cmd.exe', 12:52:48 INFO - 'DCLOCATION': 'SCL3', 12:52:48 INFO - 'DNSSUFFIX': 'wintest.releng.scl3.mozilla.com', 12:52:48 INFO - 'FP_NO_HOST_CHECK': 'NO', 12:52:48 INFO - 'HOMEDRIVE': 'C:', 12:52:48 INFO - 'HOMEPATH': '\\Users\\cltbld.T-W864-IX-370', 12:52:48 INFO - 'KTS_HOME': 'C:\\Program Files\\KTS', 12:52:48 INFO - 'KTS_VERSION': '1.19c', 12:52:48 INFO - 'LOCALAPPDATA': 'C:\\Users\\cltbld.T-W864-IX-370\\AppData\\Local', 12:52:48 INFO - 'LOGONSERVER': '\\\\T-W864-IX-370', 12:52:48 INFO - 'MONDIR': 'C:\\Monitor_config\\', 12:52:48 INFO - 'MOZBUILDDIR': 'C:\\mozilla-build\\', 12:52:48 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 12:52:48 INFO - 'MOZ_NO_REMOTE': '1', 12:52:48 INFO - 'NO_EM_RESTART': '1', 12:52:48 INFO - 'NUMBER_OF_PROCESSORS': '8', 12:52:48 INFO - 'OS': 'Windows_NT', 12:52:48 INFO - 'OURDRIVE': 'C:', 12:52:48 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', 12:52:48 INFO - 'PATHEXT': '.COM;.EXE;.BAT;.CMD;.VBS;.VBE;.JS;.JSE;.WSF;.WSH;.MSC', 12:52:48 INFO - 'PROCESSOR_ARCHITECTURE': 'x86', 12:52:48 INFO - 'PROCESSOR_ARCHITEW6432': 'AMD64', 12:52:48 INFO - 'PROCESSOR_IDENTIFIER': 'Intel64 Family 6 Model 30 Stepping 5, GenuineIntel', 12:52:48 INFO - 'PROCESSOR_LEVEL': '6', 12:52:48 INFO - 'PROCESSOR_REVISION': '1e05', 12:52:48 INFO - 'PROGRAMDATA': 'C:\\ProgramData', 12:52:48 INFO - 'PROGRAMFILES': 'C:\\Program Files (x86)', 12:52:48 INFO - 'PROGRAMFILES(X86)': 'C:\\Program Files (x86)', 12:52:48 INFO - 'PROGRAMW6432': 'C:\\Program Files', 12:52:48 INFO - 'PROMPT': '$P$G', 12:52:48 INFO - 'PROPERTIES_FILE': 'C:\\slave\\test/buildprops.json', 12:52:48 INFO - 'PSMODULEPATH': 'C:\\windows\\system32\\WindowsPowerShell\\v1.0\\Modules\\', 12:52:48 INFO - 'PUBLIC': 'C:\\Users\\Public', 12:52:48 INFO - 'PWD': 'C:\\slave\\test', 12:52:48 INFO - 'RUNLOGFILE': 'C:\\slave\\\\runslave.log', 12:52:48 INFO - 'SLAVEDIR': 'C:\\slave\\', 12:52:48 INFO - 'SYSTEMDRIVE': 'C:', 12:52:48 INFO - 'SYSTEMROOT': 'C:\\windows', 12:52:48 INFO - 'TEMP': 'C:\\Users\\CLTBLD~1.T-W\\AppData\\Local\\Temp', 12:52:48 INFO - 'TEST1': 'testie', 12:52:48 INFO - 'TMP': 'C:\\Users\\CLTBLD~1.T-W\\AppData\\Local\\Temp', 12:52:48 INFO - 'USERDOMAIN': 'T-W864-IX-370', 12:52:48 INFO - 'USERDOMAIN_ROAMINGPROFILE': 'T-W864-IX-370', 12:52:48 INFO - 'USERNAME': 'cltbld', 12:52:48 INFO - 'USERPROFILE': 'C:\\Users\\cltbld.T-W864-IX-370', 12:52:48 INFO - 'WINDIR': 'C:\\windows', 12:52:48 INFO - 'XPCOM_DEBUG_BREAK': 'warn'} 12:52:49 INFO - Ignoring indexes: http://pypi.python.org/simple/ 12:52:49 INFO - Downloading/unpacking pip>=1.5 12:52:53 INFO - Running setup.py egg_info for package pip 12:52:53 INFO - warning: no files found matching 'pip\cacert.pem' 12:52:53 INFO - warning: no files found matching '*.html' under directory 'docs' 12:52:53 INFO - warning: no previously-included files matching '*.rst' found under directory 'docs\_build' 12:52:53 INFO - no previously-included directories found matching 'docs\_build\_sources' 12:52:53 INFO - Installing collected packages: pip 12:52:53 INFO - Found existing installation: pip 0.8.2 12:52:53 INFO - Uninstalling pip: 12:52:53 INFO - Successfully uninstalled pip 12:52:53 INFO - Running setup.py install for pip 12:52:53 INFO - warning: no files found matching 'pip\cacert.pem' 12:52:53 INFO - warning: no files found matching '*.html' under directory 'docs' 12:52:53 INFO - warning: no previously-included files matching '*.rst' found under directory 'docs\_build' 12:52:53 INFO - no previously-included directories found matching 'docs\_build\_sources' 12:52:53 INFO - Installing pip-script.py script to C:\slave\test\build\venv\Scripts 12:52:53 INFO - Installing pip.exe script to C:\slave\test\build\venv\Scripts 12:52:53 INFO - Installing pip2.7-script.py script to C:\slave\test\build\venv\Scripts 12:52:53 INFO - Installing pip2.7.exe script to C:\slave\test\build\venv\Scripts 12:52:53 INFO - Installing pip2-script.py script to C:\slave\test\build\venv\Scripts 12:52:53 INFO - Installing pip2.exe script to C:\slave\test\build\venv\Scripts 12:52:53 INFO - Successfully installed pip 12:52:53 INFO - Cleaning up... 12:52:53 INFO - Return code: 0 12:52:53 INFO - Installing psutil>=3.1.1 into virtualenv C:\slave\test\build/venv 12:52: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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 12:52:53 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 12:52: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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 12:52:53 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 12:52:53 INFO - retry: Calling run_command with args: [['C:\\slave\\test\\build\\venv\\Scripts\\pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=3.1.1']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x021ED640>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x02797020>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x01D00808>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x022B5E90>, '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 0x01C6A910>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x027765C0>, 'level': 'critical'}], 'cwd': 'C:\\slave\\test\\build', 'env': {'TMP': 'C:\\Users\\CLTBLD~1.T-W\\AppData\\Local\\Temp', 'TEST1': 'testie', 'COMPUTERNAME': 'T-W864-IX-370', 'USERDOMAIN': 'T-W864-IX-370', '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-370', 'LOCALAPPDATA': 'C:\\Users\\cltbld.T-W864-IX-370\\AppData\\Local', 'HOMEPATH': '\\Users\\cltbld.T-W864-IX-370', 'USERDOMAIN_ROAMINGPROFILE': 'T-W864-IX-370', 'MOZBUILDDIR': 'C:\\mozilla-build\\', 'PROGRAMW6432': 'C:\\Program Files', 'USERNAME': 'cltbld', 'LOGONSERVER': '\\\\T-W864-IX-370', '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-370\\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 12:52:53 INFO - Running command: ['C:\\slave\\test\\build\\venv\\Scripts\\pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=3.1.1'] in C:\slave\test\build 12:52:53 INFO - Copy/paste: C:\slave\test\build\venv\Scripts\pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub psutil>=3.1.1 12:52:53 INFO - Using env: {'ALLUSERSPROFILE': 'C:\\ProgramData', 12:52:53 INFO - 'APPDATA': 'C:\\Users\\cltbld.T-W864-IX-370\\AppData\\Roaming', 12:52:53 INFO - 'COMMONPROGRAMFILES': 'C:\\Program Files (x86)\\Common Files', 12:52:53 INFO - 'COMMONPROGRAMFILES(X86)': 'C:\\Program Files (x86)\\Common Files', 12:52:53 INFO - 'COMMONPROGRAMW6432': 'C:\\Program Files\\Common Files', 12:52:53 INFO - 'COMPUTERNAME': 'T-W864-IX-370', 12:52:53 INFO - 'COMSPEC': 'C:\\windows\\system32\\cmd.exe', 12:52:53 INFO - 'DCLOCATION': 'SCL3', 12:52:53 INFO - 'DNSSUFFIX': 'wintest.releng.scl3.mozilla.com', 12:52:53 INFO - 'FP_NO_HOST_CHECK': 'NO', 12:52:53 INFO - 'HOMEDRIVE': 'C:', 12:52:53 INFO - 'HOMEPATH': '\\Users\\cltbld.T-W864-IX-370', 12:52:53 INFO - 'KTS_HOME': 'C:\\Program Files\\KTS', 12:52:53 INFO - 'KTS_VERSION': '1.19c', 12:52:53 INFO - 'LOCALAPPDATA': 'C:\\Users\\cltbld.T-W864-IX-370\\AppData\\Local', 12:52:53 INFO - 'LOGONSERVER': '\\\\T-W864-IX-370', 12:52:53 INFO - 'MONDIR': 'C:\\Monitor_config\\', 12:52:53 INFO - 'MOZBUILDDIR': 'C:\\mozilla-build\\', 12:52:53 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 12:52:53 INFO - 'MOZ_NO_REMOTE': '1', 12:52:53 INFO - 'NO_EM_RESTART': '1', 12:52:53 INFO - 'NUMBER_OF_PROCESSORS': '8', 12:52:53 INFO - 'OS': 'Windows_NT', 12:52:53 INFO - 'OURDRIVE': 'C:', 12:52:53 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', 12:52:53 INFO - 'PATHEXT': '.COM;.EXE;.BAT;.CMD;.VBS;.VBE;.JS;.JSE;.WSF;.WSH;.MSC', 12:52:53 INFO - 'PROCESSOR_ARCHITECTURE': 'x86', 12:52:53 INFO - 'PROCESSOR_ARCHITEW6432': 'AMD64', 12:52:53 INFO - 'PROCESSOR_IDENTIFIER': 'Intel64 Family 6 Model 30 Stepping 5, GenuineIntel', 12:52:53 INFO - 'PROCESSOR_LEVEL': '6', 12:52:53 INFO - 'PROCESSOR_REVISION': '1e05', 12:52:53 INFO - 'PROGRAMDATA': 'C:\\ProgramData', 12:52:53 INFO - 'PROGRAMFILES': 'C:\\Program Files (x86)', 12:52:53 INFO - 'PROGRAMFILES(X86)': 'C:\\Program Files (x86)', 12:52:53 INFO - 'PROGRAMW6432': 'C:\\Program Files', 12:52:53 INFO - 'PROMPT': '$P$G', 12:52:53 INFO - 'PROPERTIES_FILE': 'C:\\slave\\test/buildprops.json', 12:52:53 INFO - 'PSMODULEPATH': 'C:\\windows\\system32\\WindowsPowerShell\\v1.0\\Modules\\', 12:52:53 INFO - 'PUBLIC': 'C:\\Users\\Public', 12:52:53 INFO - 'PWD': 'C:\\slave\\test', 12:52:53 INFO - 'RUNLOGFILE': 'C:\\slave\\\\runslave.log', 12:52:53 INFO - 'SLAVEDIR': 'C:\\slave\\', 12:52:53 INFO - 'SYSTEMDRIVE': 'C:', 12:52:53 INFO - 'SYSTEMROOT': 'C:\\windows', 12:52:53 INFO - 'TEMP': 'C:\\Users\\CLTBLD~1.T-W\\AppData\\Local\\Temp', 12:52:53 INFO - 'TEST1': 'testie', 12:52:53 INFO - 'TMP': 'C:\\Users\\CLTBLD~1.T-W\\AppData\\Local\\Temp', 12:52:53 INFO - 'USERDOMAIN': 'T-W864-IX-370', 12:52:53 INFO - 'USERDOMAIN_ROAMINGPROFILE': 'T-W864-IX-370', 12:52:53 INFO - 'USERNAME': 'cltbld', 12:52:53 INFO - 'USERPROFILE': 'C:\\Users\\cltbld.T-W864-IX-370', 12:52:53 INFO - 'WINDIR': 'C:\\windows', 12:52:53 INFO - 'XPCOM_DEBUG_BREAK': 'warn'} 12:52:55 INFO - Ignoring indexes: https://pypi.python.org/simple/ 12:52:55 INFO - Downloading/unpacking psutil>=3.1.1 12:52:55 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 12:52:55 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 12:52:56 INFO - Installing collected packages: psutil 12:52:56 INFO - Successfully installed psutil 12:52:56 INFO - Cleaning up... 12:52:56 INFO - Return code: 0 12:52:56 INFO - Installing mozsystemmonitor==0.3 into virtualenv C:\slave\test\build/venv 12:52:56 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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 12:52:56 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 12:52:56 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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 12:52:56 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 12:52:56 INFO - retry: Calling run_command with args: [['C:\\slave\\test\\build\\venv\\Scripts\\pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.3']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x021ED640>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x02797020>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x01D00808>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x022B5E90>, '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 0x01C6A910>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x027765C0>, 'level': 'critical'}], 'cwd': 'C:\\slave\\test\\build', 'env': {'TMP': 'C:\\Users\\CLTBLD~1.T-W\\AppData\\Local\\Temp', 'TEST1': 'testie', 'COMPUTERNAME': 'T-W864-IX-370', 'USERDOMAIN': 'T-W864-IX-370', '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-370', 'LOCALAPPDATA': 'C:\\Users\\cltbld.T-W864-IX-370\\AppData\\Local', 'HOMEPATH': '\\Users\\cltbld.T-W864-IX-370', 'USERDOMAIN_ROAMINGPROFILE': 'T-W864-IX-370', 'MOZBUILDDIR': 'C:\\mozilla-build\\', 'PROGRAMW6432': 'C:\\Program Files', 'USERNAME': 'cltbld', 'LOGONSERVER': '\\\\T-W864-IX-370', '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-370\\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 12:52:56 INFO - Running command: ['C:\\slave\\test\\build\\venv\\Scripts\\pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.3'] in C:\slave\test\build 12:52:56 INFO - Copy/paste: C:\slave\test\build\venv\Scripts\pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub mozsystemmonitor==0.3 12:52:56 INFO - Using env: {'ALLUSERSPROFILE': 'C:\\ProgramData', 12:52:56 INFO - 'APPDATA': 'C:\\Users\\cltbld.T-W864-IX-370\\AppData\\Roaming', 12:52:56 INFO - 'COMMONPROGRAMFILES': 'C:\\Program Files (x86)\\Common Files', 12:52:56 INFO - 'COMMONPROGRAMFILES(X86)': 'C:\\Program Files (x86)\\Common Files', 12:52:56 INFO - 'COMMONPROGRAMW6432': 'C:\\Program Files\\Common Files', 12:52:56 INFO - 'COMPUTERNAME': 'T-W864-IX-370', 12:52:56 INFO - 'COMSPEC': 'C:\\windows\\system32\\cmd.exe', 12:52:56 INFO - 'DCLOCATION': 'SCL3', 12:52:56 INFO - 'DNSSUFFIX': 'wintest.releng.scl3.mozilla.com', 12:52:56 INFO - 'FP_NO_HOST_CHECK': 'NO', 12:52:56 INFO - 'HOMEDRIVE': 'C:', 12:52:56 INFO - 'HOMEPATH': '\\Users\\cltbld.T-W864-IX-370', 12:52:56 INFO - 'KTS_HOME': 'C:\\Program Files\\KTS', 12:52:56 INFO - 'KTS_VERSION': '1.19c', 12:52:56 INFO - 'LOCALAPPDATA': 'C:\\Users\\cltbld.T-W864-IX-370\\AppData\\Local', 12:52:56 INFO - 'LOGONSERVER': '\\\\T-W864-IX-370', 12:52:56 INFO - 'MONDIR': 'C:\\Monitor_config\\', 12:52:56 INFO - 'MOZBUILDDIR': 'C:\\mozilla-build\\', 12:52:56 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 12:52:56 INFO - 'MOZ_NO_REMOTE': '1', 12:52:56 INFO - 'NO_EM_RESTART': '1', 12:52:56 INFO - 'NUMBER_OF_PROCESSORS': '8', 12:52:56 INFO - 'OS': 'Windows_NT', 12:52:56 INFO - 'OURDRIVE': 'C:', 12:52:56 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', 12:52:56 INFO - 'PATHEXT': '.COM;.EXE;.BAT;.CMD;.VBS;.VBE;.JS;.JSE;.WSF;.WSH;.MSC', 12:52:56 INFO - 'PROCESSOR_ARCHITECTURE': 'x86', 12:52:56 INFO - 'PROCESSOR_ARCHITEW6432': 'AMD64', 12:52:56 INFO - 'PROCESSOR_IDENTIFIER': 'Intel64 Family 6 Model 30 Stepping 5, GenuineIntel', 12:52:56 INFO - 'PROCESSOR_LEVEL': '6', 12:52:56 INFO - 'PROCESSOR_REVISION': '1e05', 12:52:56 INFO - 'PROGRAMDATA': 'C:\\ProgramData', 12:52:56 INFO - 'PROGRAMFILES': 'C:\\Program Files (x86)', 12:52:56 INFO - 'PROGRAMFILES(X86)': 'C:\\Program Files (x86)', 12:52:56 INFO - 'PROGRAMW6432': 'C:\\Program Files', 12:52:56 INFO - 'PROMPT': '$P$G', 12:52:56 INFO - 'PROPERTIES_FILE': 'C:\\slave\\test/buildprops.json', 12:52:56 INFO - 'PSMODULEPATH': 'C:\\windows\\system32\\WindowsPowerShell\\v1.0\\Modules\\', 12:52:56 INFO - 'PUBLIC': 'C:\\Users\\Public', 12:52:56 INFO - 'PWD': 'C:\\slave\\test', 12:52:56 INFO - 'RUNLOGFILE': 'C:\\slave\\\\runslave.log', 12:52:56 INFO - 'SLAVEDIR': 'C:\\slave\\', 12:52:56 INFO - 'SYSTEMDRIVE': 'C:', 12:52:56 INFO - 'SYSTEMROOT': 'C:\\windows', 12:52:56 INFO - 'TEMP': 'C:\\Users\\CLTBLD~1.T-W\\AppData\\Local\\Temp', 12:52:56 INFO - 'TEST1': 'testie', 12:52:56 INFO - 'TMP': 'C:\\Users\\CLTBLD~1.T-W\\AppData\\Local\\Temp', 12:52:56 INFO - 'USERDOMAIN': 'T-W864-IX-370', 12:52:56 INFO - 'USERDOMAIN_ROAMINGPROFILE': 'T-W864-IX-370', 12:52:56 INFO - 'USERNAME': 'cltbld', 12:52:56 INFO - 'USERPROFILE': 'C:\\Users\\cltbld.T-W864-IX-370', 12:52:56 INFO - 'WINDIR': 'C:\\windows', 12:52:56 INFO - 'XPCOM_DEBUG_BREAK': 'warn'} 12:52:57 INFO - Ignoring indexes: https://pypi.python.org/simple/ 12:52:57 INFO - Downloading/unpacking mozsystemmonitor==0.3 12:52:57 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 12:52:57 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 12:52:58 INFO - Downloading mozsystemmonitor-0.3.tar.gz 12:52:58 INFO - Running setup.py (path:C:\slave\test\build\venv\build\mozsystemmonitor\setup.py) egg_info for package mozsystemmonitor 12:52:58 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in c:\slave\test\build\venv\lib\site-packages (from mozsystemmonitor==0.3) 12:52:58 INFO - Installing collected packages: mozsystemmonitor 12:52:58 INFO - Running setup.py install for mozsystemmonitor 12:52:58 INFO - Successfully installed mozsystemmonitor 12:52:58 INFO - Cleaning up... 12:52:58 INFO - Return code: 0 12:52:58 INFO - Installing jsonschema==2.5.1 into virtualenv C:\slave\test\build/venv 12:52: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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 12:52:58 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 12:52: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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 12:52:58 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 12:52:58 INFO - retry: Calling run_command with args: [['C:\\slave\\test\\build\\venv\\Scripts\\pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema==2.5.1']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x021ED640>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x02797020>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x01D00808>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x022B5E90>, '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 0x01C6A910>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x027765C0>, 'level': 'critical'}], 'cwd': 'C:\\slave\\test\\build', 'env': {'TMP': 'C:\\Users\\CLTBLD~1.T-W\\AppData\\Local\\Temp', 'TEST1': 'testie', 'COMPUTERNAME': 'T-W864-IX-370', 'USERDOMAIN': 'T-W864-IX-370', '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-370', 'LOCALAPPDATA': 'C:\\Users\\cltbld.T-W864-IX-370\\AppData\\Local', 'HOMEPATH': '\\Users\\cltbld.T-W864-IX-370', 'USERDOMAIN_ROAMINGPROFILE': 'T-W864-IX-370', 'MOZBUILDDIR': 'C:\\mozilla-build\\', 'PROGRAMW6432': 'C:\\Program Files', 'USERNAME': 'cltbld', 'LOGONSERVER': '\\\\T-W864-IX-370', '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-370\\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 12:52:58 INFO - Running command: ['C:\\slave\\test\\build\\venv\\Scripts\\pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema==2.5.1'] in C:\slave\test\build 12:52:58 INFO - Copy/paste: C:\slave\test\build\venv\Scripts\pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema==2.5.1 12:52:58 INFO - Using env: {'ALLUSERSPROFILE': 'C:\\ProgramData', 12:52:58 INFO - 'APPDATA': 'C:\\Users\\cltbld.T-W864-IX-370\\AppData\\Roaming', 12:52:58 INFO - 'COMMONPROGRAMFILES': 'C:\\Program Files (x86)\\Common Files', 12:52:58 INFO - 'COMMONPROGRAMFILES(X86)': 'C:\\Program Files (x86)\\Common Files', 12:52:58 INFO - 'COMMONPROGRAMW6432': 'C:\\Program Files\\Common Files', 12:52:58 INFO - 'COMPUTERNAME': 'T-W864-IX-370', 12:52:58 INFO - 'COMSPEC': 'C:\\windows\\system32\\cmd.exe', 12:52:58 INFO - 'DCLOCATION': 'SCL3', 12:52:58 INFO - 'DNSSUFFIX': 'wintest.releng.scl3.mozilla.com', 12:52:58 INFO - 'FP_NO_HOST_CHECK': 'NO', 12:52:58 INFO - 'HOMEDRIVE': 'C:', 12:52:58 INFO - 'HOMEPATH': '\\Users\\cltbld.T-W864-IX-370', 12:52:58 INFO - 'KTS_HOME': 'C:\\Program Files\\KTS', 12:52:58 INFO - 'KTS_VERSION': '1.19c', 12:52:58 INFO - 'LOCALAPPDATA': 'C:\\Users\\cltbld.T-W864-IX-370\\AppData\\Local', 12:52:58 INFO - 'LOGONSERVER': '\\\\T-W864-IX-370', 12:52:58 INFO - 'MONDIR': 'C:\\Monitor_config\\', 12:52:58 INFO - 'MOZBUILDDIR': 'C:\\mozilla-build\\', 12:52:58 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 12:52:58 INFO - 'MOZ_NO_REMOTE': '1', 12:52:58 INFO - 'NO_EM_RESTART': '1', 12:52:58 INFO - 'NUMBER_OF_PROCESSORS': '8', 12:52:58 INFO - 'OS': 'Windows_NT', 12:52:58 INFO - 'OURDRIVE': 'C:', 12:52:58 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', 12:52:58 INFO - 'PATHEXT': '.COM;.EXE;.BAT;.CMD;.VBS;.VBE;.JS;.JSE;.WSF;.WSH;.MSC', 12:52:58 INFO - 'PROCESSOR_ARCHITECTURE': 'x86', 12:52:58 INFO - 'PROCESSOR_ARCHITEW6432': 'AMD64', 12:52:58 INFO - 'PROCESSOR_IDENTIFIER': 'Intel64 Family 6 Model 30 Stepping 5, GenuineIntel', 12:52:58 INFO - 'PROCESSOR_LEVEL': '6', 12:52:58 INFO - 'PROCESSOR_REVISION': '1e05', 12:52:58 INFO - 'PROGRAMDATA': 'C:\\ProgramData', 12:52:58 INFO - 'PROGRAMFILES': 'C:\\Program Files (x86)', 12:52:58 INFO - 'PROGRAMFILES(X86)': 'C:\\Program Files (x86)', 12:52:58 INFO - 'PROGRAMW6432': 'C:\\Program Files', 12:52:58 INFO - 'PROMPT': '$P$G', 12:52:58 INFO - 'PROPERTIES_FILE': 'C:\\slave\\test/buildprops.json', 12:52:58 INFO - 'PSMODULEPATH': 'C:\\windows\\system32\\WindowsPowerShell\\v1.0\\Modules\\', 12:52:58 INFO - 'PUBLIC': 'C:\\Users\\Public', 12:52:58 INFO - 'PWD': 'C:\\slave\\test', 12:52:58 INFO - 'RUNLOGFILE': 'C:\\slave\\\\runslave.log', 12:52:58 INFO - 'SLAVEDIR': 'C:\\slave\\', 12:52:58 INFO - 'SYSTEMDRIVE': 'C:', 12:52:58 INFO - 'SYSTEMROOT': 'C:\\windows', 12:52:58 INFO - 'TEMP': 'C:\\Users\\CLTBLD~1.T-W\\AppData\\Local\\Temp', 12:52:58 INFO - 'TEST1': 'testie', 12:52:58 INFO - 'TMP': 'C:\\Users\\CLTBLD~1.T-W\\AppData\\Local\\Temp', 12:52:58 INFO - 'USERDOMAIN': 'T-W864-IX-370', 12:52:58 INFO - 'USERDOMAIN_ROAMINGPROFILE': 'T-W864-IX-370', 12:52:58 INFO - 'USERNAME': 'cltbld', 12:52:58 INFO - 'USERPROFILE': 'C:\\Users\\cltbld.T-W864-IX-370', 12:52:58 INFO - 'WINDIR': 'C:\\windows', 12:52:58 INFO - 'XPCOM_DEBUG_BREAK': 'warn'} 12:52:59 INFO - Ignoring indexes: https://pypi.python.org/simple/ 12:52:59 INFO - Downloading/unpacking jsonschema==2.5.1 12:52:59 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 12:52:59 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 12:53:00 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 12:53:00 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 12:53:00 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 12:53:00 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 12:53:00 INFO - Downloading functools32-3.2.3-2.tar.gz 12:53:00 INFO - Running setup.py (path:C:\slave\test\build\venv\build\functools32\setup.py) egg_info for package functools32 12:53:00 INFO - warning: no files found matching '*.txt' 12:53:00 INFO - no previously-included directories found matching 'build' 12:53:00 INFO - no previously-included directories found matching 'dist' 12:53:00 INFO - no previously-included directories found matching '.git*' 12:53:00 INFO - Installing collected packages: jsonschema, functools32 12:53:00 INFO - Running setup.py install for functools32 12:53:00 INFO - warning: no files found matching '*.txt' 12:53:00 INFO - no previously-included directories found matching 'build' 12:53:00 INFO - no previously-included directories found matching 'dist' 12:53:00 INFO - no previously-included directories found matching '.git*' 12:53:00 INFO - Successfully installed jsonschema functools32 12:53:00 INFO - Cleaning up... 12:53:01 INFO - Return code: 0 12:53:01 INFO - Installing functools32==3.2.3-2 into virtualenv C:\slave\test\build/venv 12:53:01 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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 12:53:01 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 12:53:01 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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 12:53:01 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 12:53:01 INFO - retry: Calling run_command with args: [['C:\\slave\\test\\build\\venv\\Scripts\\pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'functools32==3.2.3-2']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x021ED640>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x02797020>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x01D00808>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x022B5E90>, '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 0x01C6A910>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x027765C0>, 'level': 'critical'}], 'cwd': 'C:\\slave\\test\\build', 'env': {'TMP': 'C:\\Users\\CLTBLD~1.T-W\\AppData\\Local\\Temp', 'TEST1': 'testie', 'COMPUTERNAME': 'T-W864-IX-370', 'USERDOMAIN': 'T-W864-IX-370', '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-370', 'LOCALAPPDATA': 'C:\\Users\\cltbld.T-W864-IX-370\\AppData\\Local', 'HOMEPATH': '\\Users\\cltbld.T-W864-IX-370', 'USERDOMAIN_ROAMINGPROFILE': 'T-W864-IX-370', 'MOZBUILDDIR': 'C:\\mozilla-build\\', 'PROGRAMW6432': 'C:\\Program Files', 'USERNAME': 'cltbld', 'LOGONSERVER': '\\\\T-W864-IX-370', '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-370\\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 12:53:01 INFO - Running command: ['C:\\slave\\test\\build\\venv\\Scripts\\pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'functools32==3.2.3-2'] in C:\slave\test\build 12:53:01 INFO - Copy/paste: C:\slave\test\build\venv\Scripts\pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub functools32==3.2.3-2 12:53:01 INFO - Using env: {'ALLUSERSPROFILE': 'C:\\ProgramData', 12:53:01 INFO - 'APPDATA': 'C:\\Users\\cltbld.T-W864-IX-370\\AppData\\Roaming', 12:53:01 INFO - 'COMMONPROGRAMFILES': 'C:\\Program Files (x86)\\Common Files', 12:53:01 INFO - 'COMMONPROGRAMFILES(X86)': 'C:\\Program Files (x86)\\Common Files', 12:53:01 INFO - 'COMMONPROGRAMW6432': 'C:\\Program Files\\Common Files', 12:53:01 INFO - 'COMPUTERNAME': 'T-W864-IX-370', 12:53:01 INFO - 'COMSPEC': 'C:\\windows\\system32\\cmd.exe', 12:53:01 INFO - 'DCLOCATION': 'SCL3', 12:53:01 INFO - 'DNSSUFFIX': 'wintest.releng.scl3.mozilla.com', 12:53:01 INFO - 'FP_NO_HOST_CHECK': 'NO', 12:53:01 INFO - 'HOMEDRIVE': 'C:', 12:53:01 INFO - 'HOMEPATH': '\\Users\\cltbld.T-W864-IX-370', 12:53:01 INFO - 'KTS_HOME': 'C:\\Program Files\\KTS', 12:53:01 INFO - 'KTS_VERSION': '1.19c', 12:53:01 INFO - 'LOCALAPPDATA': 'C:\\Users\\cltbld.T-W864-IX-370\\AppData\\Local', 12:53:01 INFO - 'LOGONSERVER': '\\\\T-W864-IX-370', 12:53:01 INFO - 'MONDIR': 'C:\\Monitor_config\\', 12:53:01 INFO - 'MOZBUILDDIR': 'C:\\mozilla-build\\', 12:53:01 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 12:53:01 INFO - 'MOZ_NO_REMOTE': '1', 12:53:01 INFO - 'NO_EM_RESTART': '1', 12:53:01 INFO - 'NUMBER_OF_PROCESSORS': '8', 12:53:01 INFO - 'OS': 'Windows_NT', 12:53:01 INFO - 'OURDRIVE': 'C:', 12:53:01 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', 12:53:01 INFO - 'PATHEXT': '.COM;.EXE;.BAT;.CMD;.VBS;.VBE;.JS;.JSE;.WSF;.WSH;.MSC', 12:53:01 INFO - 'PROCESSOR_ARCHITECTURE': 'x86', 12:53:01 INFO - 'PROCESSOR_ARCHITEW6432': 'AMD64', 12:53:01 INFO - 'PROCESSOR_IDENTIFIER': 'Intel64 Family 6 Model 30 Stepping 5, GenuineIntel', 12:53:01 INFO - 'PROCESSOR_LEVEL': '6', 12:53:01 INFO - 'PROCESSOR_REVISION': '1e05', 12:53:01 INFO - 'PROGRAMDATA': 'C:\\ProgramData', 12:53:01 INFO - 'PROGRAMFILES': 'C:\\Program Files (x86)', 12:53:01 INFO - 'PROGRAMFILES(X86)': 'C:\\Program Files (x86)', 12:53:01 INFO - 'PROGRAMW6432': 'C:\\Program Files', 12:53:01 INFO - 'PROMPT': '$P$G', 12:53:01 INFO - 'PROPERTIES_FILE': 'C:\\slave\\test/buildprops.json', 12:53:01 INFO - 'PSMODULEPATH': 'C:\\windows\\system32\\WindowsPowerShell\\v1.0\\Modules\\', 12:53:01 INFO - 'PUBLIC': 'C:\\Users\\Public', 12:53:01 INFO - 'PWD': 'C:\\slave\\test', 12:53:01 INFO - 'RUNLOGFILE': 'C:\\slave\\\\runslave.log', 12:53:01 INFO - 'SLAVEDIR': 'C:\\slave\\', 12:53:01 INFO - 'SYSTEMDRIVE': 'C:', 12:53:01 INFO - 'SYSTEMROOT': 'C:\\windows', 12:53:01 INFO - 'TEMP': 'C:\\Users\\CLTBLD~1.T-W\\AppData\\Local\\Temp', 12:53:01 INFO - 'TEST1': 'testie', 12:53:01 INFO - 'TMP': 'C:\\Users\\CLTBLD~1.T-W\\AppData\\Local\\Temp', 12:53:01 INFO - 'USERDOMAIN': 'T-W864-IX-370', 12:53:01 INFO - 'USERDOMAIN_ROAMINGPROFILE': 'T-W864-IX-370', 12:53:01 INFO - 'USERNAME': 'cltbld', 12:53:01 INFO - 'USERPROFILE': 'C:\\Users\\cltbld.T-W864-IX-370', 12:53:01 INFO - 'WINDIR': 'C:\\windows', 12:53:01 INFO - 'XPCOM_DEBUG_BREAK': 'warn'} 12:53:01 INFO - Ignoring indexes: https://pypi.python.org/simple/ 12:53:01 INFO - Requirement already satisfied (use --upgrade to upgrade): functools32==3.2.3-2 in c:\slave\test\build\venv\lib\site-packages 12:53:01 INFO - Cleaning up... 12:53:01 INFO - Return code: 0 12:53:01 INFO - Installing blobuploader==1.2.4 into virtualenv C:\slave\test\build/venv 12:53:01 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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 12:53:01 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 12:53:01 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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 12:53:01 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 12:53:01 INFO - retry: Calling run_command with args: [['C:\\slave\\test\\build\\venv\\Scripts\\pip', 'install', '--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 0x021ED640>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x02797020>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x01D00808>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x022B5E90>, '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 0x01C6A910>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x027765C0>, 'level': 'critical'}], 'cwd': 'C:\\slave\\test\\build', 'env': {'TMP': 'C:\\Users\\CLTBLD~1.T-W\\AppData\\Local\\Temp', 'TEST1': 'testie', 'COMPUTERNAME': 'T-W864-IX-370', 'USERDOMAIN': 'T-W864-IX-370', '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-370', 'LOCALAPPDATA': 'C:\\Users\\cltbld.T-W864-IX-370\\AppData\\Local', 'HOMEPATH': '\\Users\\cltbld.T-W864-IX-370', 'USERDOMAIN_ROAMINGPROFILE': 'T-W864-IX-370', 'MOZBUILDDIR': 'C:\\mozilla-build\\', 'PROGRAMW6432': 'C:\\Program Files', 'USERNAME': 'cltbld', 'LOGONSERVER': '\\\\T-W864-IX-370', '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-370\\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 12:53:01 INFO - Running command: ['C:\\slave\\test\\build\\venv\\Scripts\\pip', 'install', '--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 12:53:01 INFO - Copy/paste: C:\slave\test\build\venv\Scripts\pip install --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 12:53:01 INFO - Using env: {'ALLUSERSPROFILE': 'C:\\ProgramData', 12:53:01 INFO - 'APPDATA': 'C:\\Users\\cltbld.T-W864-IX-370\\AppData\\Roaming', 12:53:01 INFO - 'COMMONPROGRAMFILES': 'C:\\Program Files (x86)\\Common Files', 12:53:01 INFO - 'COMMONPROGRAMFILES(X86)': 'C:\\Program Files (x86)\\Common Files', 12:53:01 INFO - 'COMMONPROGRAMW6432': 'C:\\Program Files\\Common Files', 12:53:01 INFO - 'COMPUTERNAME': 'T-W864-IX-370', 12:53:01 INFO - 'COMSPEC': 'C:\\windows\\system32\\cmd.exe', 12:53:01 INFO - 'DCLOCATION': 'SCL3', 12:53:01 INFO - 'DNSSUFFIX': 'wintest.releng.scl3.mozilla.com', 12:53:01 INFO - 'FP_NO_HOST_CHECK': 'NO', 12:53:01 INFO - 'HOMEDRIVE': 'C:', 12:53:01 INFO - 'HOMEPATH': '\\Users\\cltbld.T-W864-IX-370', 12:53:01 INFO - 'KTS_HOME': 'C:\\Program Files\\KTS', 12:53:01 INFO - 'KTS_VERSION': '1.19c', 12:53:01 INFO - 'LOCALAPPDATA': 'C:\\Users\\cltbld.T-W864-IX-370\\AppData\\Local', 12:53:01 INFO - 'LOGONSERVER': '\\\\T-W864-IX-370', 12:53:01 INFO - 'MONDIR': 'C:\\Monitor_config\\', 12:53:01 INFO - 'MOZBUILDDIR': 'C:\\mozilla-build\\', 12:53:01 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 12:53:01 INFO - 'MOZ_NO_REMOTE': '1', 12:53:01 INFO - 'NO_EM_RESTART': '1', 12:53:01 INFO - 'NUMBER_OF_PROCESSORS': '8', 12:53:01 INFO - 'OS': 'Windows_NT', 12:53:01 INFO - 'OURDRIVE': 'C:', 12:53:01 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', 12:53:01 INFO - 'PATHEXT': '.COM;.EXE;.BAT;.CMD;.VBS;.VBE;.JS;.JSE;.WSF;.WSH;.MSC', 12:53:01 INFO - 'PROCESSOR_ARCHITECTURE': 'x86', 12:53:01 INFO - 'PROCESSOR_ARCHITEW6432': 'AMD64', 12:53:01 INFO - 'PROCESSOR_IDENTIFIER': 'Intel64 Family 6 Model 30 Stepping 5, GenuineIntel', 12:53:01 INFO - 'PROCESSOR_LEVEL': '6', 12:53:01 INFO - 'PROCESSOR_REVISION': '1e05', 12:53:01 INFO - 'PROGRAMDATA': 'C:\\ProgramData', 12:53:01 INFO - 'PROGRAMFILES': 'C:\\Program Files (x86)', 12:53:01 INFO - 'PROGRAMFILES(X86)': 'C:\\Program Files (x86)', 12:53:01 INFO - 'PROGRAMW6432': 'C:\\Program Files', 12:53:01 INFO - 'PROMPT': '$P$G', 12:53:01 INFO - 'PROPERTIES_FILE': 'C:\\slave\\test/buildprops.json', 12:53:01 INFO - 'PSMODULEPATH': 'C:\\windows\\system32\\WindowsPowerShell\\v1.0\\Modules\\', 12:53:01 INFO - 'PUBLIC': 'C:\\Users\\Public', 12:53:01 INFO - 'PWD': 'C:\\slave\\test', 12:53:01 INFO - 'RUNLOGFILE': 'C:\\slave\\\\runslave.log', 12:53:01 INFO - 'SLAVEDIR': 'C:\\slave\\', 12:53:01 INFO - 'SYSTEMDRIVE': 'C:', 12:53:01 INFO - 'SYSTEMROOT': 'C:\\windows', 12:53:01 INFO - 'TEMP': 'C:\\Users\\CLTBLD~1.T-W\\AppData\\Local\\Temp', 12:53:01 INFO - 'TEST1': 'testie', 12:53:01 INFO - 'TMP': 'C:\\Users\\CLTBLD~1.T-W\\AppData\\Local\\Temp', 12:53:01 INFO - 'USERDOMAIN': 'T-W864-IX-370', 12:53:01 INFO - 'USERDOMAIN_ROAMINGPROFILE': 'T-W864-IX-370', 12:53:01 INFO - 'USERNAME': 'cltbld', 12:53:01 INFO - 'USERPROFILE': 'C:\\Users\\cltbld.T-W864-IX-370', 12:53:01 INFO - 'WINDIR': 'C:\\windows', 12:53:01 INFO - 'XPCOM_DEBUG_BREAK': 'warn'} 12:53:01 INFO - Ignoring indexes: https://pypi.python.org/simple/ 12:53:01 INFO - Downloading/unpacking blobuploader==1.2.4 12:53:01 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 12:53:01 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 12:53:02 INFO - Downloading blobuploader-1.2.4.tar.gz 12:53:02 INFO - Running setup.py (path:C:\slave\test\build\venv\build\blobuploader\setup.py) egg_info for package blobuploader 12:53:02 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 12:53:02 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 12:53:02 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 12:53:03 INFO - Running setup.py (path:C:\slave\test\build\venv\build\requests\setup.py) egg_info for package requests 12:53:03 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 12:53:03 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 12:53:03 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 12:53:03 INFO - Downloading docopt-0.6.1.tar.gz 12:53:03 INFO - Running setup.py (path:C:\slave\test\build\venv\build\docopt\setup.py) egg_info for package docopt 12:53:03 INFO - Installing collected packages: blobuploader, requests, docopt 12:53:03 INFO - Running setup.py install for blobuploader 12:53:03 INFO - Running setup.py install for requests 12:53:04 INFO - Running setup.py install for docopt 12:53:04 INFO - Successfully installed blobuploader requests docopt 12:53:04 INFO - Cleaning up... 12:53:05 INFO - Return code: 0 12:53:05 INFO - Installing None into virtualenv C:\slave\test\build/venv 12:53:05 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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 12:53:05 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 12:53:05 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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 12:53:05 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 12:53:05 INFO - retry: Calling run_command with args: [['C:\\slave\\test\\build\\venv\\Scripts\\pip', 'install', '--no-deps', '--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 0x021ED640>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x02797020>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x01D00808>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x022B5E90>, '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 0x01C6A910>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x027765C0>, '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-370', 'USERDOMAIN': 'T-W864-IX-370', '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-370', 'LOCALAPPDATA': 'C:\\Users\\cltbld.T-W864-IX-370\\AppData\\Local', 'HOMEPATH': '\\Users\\cltbld.T-W864-IX-370', 'USERDOMAIN_ROAMINGPROFILE': 'T-W864-IX-370', 'MOZBUILDDIR': 'C:\\mozilla-build\\', 'PROGRAMW6432': 'C:\\Program Files', 'USERNAME': 'cltbld', 'LOGONSERVER': '\\\\T-W864-IX-370', '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-370\\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 12:53:05 INFO - Running command: ['C:\\slave\\test\\build\\venv\\Scripts\\pip', 'install', '--no-deps', '--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 12:53:05 INFO - Copy/paste: C:\slave\test\build\venv\Scripts\pip install --no-deps --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 12:53:05 INFO - Using env: {'ALLUSERSPROFILE': 'C:\\ProgramData', 12:53:05 INFO - 'APPDATA': 'C:\\Users\\cltbld.T-W864-IX-370\\AppData\\Roaming', 12:53:05 INFO - 'COMMONPROGRAMFILES': 'C:\\Program Files (x86)\\Common Files', 12:53:05 INFO - 'COMMONPROGRAMFILES(X86)': 'C:\\Program Files (x86)\\Common Files', 12:53:05 INFO - 'COMMONPROGRAMW6432': 'C:\\Program Files\\Common Files', 12:53:05 INFO - 'COMPUTERNAME': 'T-W864-IX-370', 12:53:05 INFO - 'COMSPEC': 'C:\\windows\\system32\\cmd.exe', 12:53:05 INFO - 'DCLOCATION': 'SCL3', 12:53:05 INFO - 'DNSSUFFIX': 'wintest.releng.scl3.mozilla.com', 12:53:05 INFO - 'FP_NO_HOST_CHECK': 'NO', 12:53:05 INFO - 'HOMEDRIVE': 'C:', 12:53:05 INFO - 'HOMEPATH': '\\Users\\cltbld.T-W864-IX-370', 12:53:05 INFO - 'KTS_HOME': 'C:\\Program Files\\KTS', 12:53:05 INFO - 'KTS_VERSION': '1.19c', 12:53:05 INFO - 'LOCALAPPDATA': 'C:\\Users\\cltbld.T-W864-IX-370\\AppData\\Local', 12:53:05 INFO - 'LOGONSERVER': '\\\\T-W864-IX-370', 12:53:05 INFO - 'MONDIR': 'C:\\Monitor_config\\', 12:53:05 INFO - 'MOZBUILDDIR': 'C:\\mozilla-build\\', 12:53:05 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 12:53:05 INFO - 'MOZ_NO_REMOTE': '1', 12:53:05 INFO - 'NO_EM_RESTART': '1', 12:53:05 INFO - 'NUMBER_OF_PROCESSORS': '8', 12:53:05 INFO - 'OS': 'Windows_NT', 12:53:05 INFO - 'OURDRIVE': 'C:', 12:53:05 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', 12:53:05 INFO - 'PATHEXT': '.COM;.EXE;.BAT;.CMD;.VBS;.VBE;.JS;.JSE;.WSF;.WSH;.MSC', 12:53:05 INFO - 'PROCESSOR_ARCHITECTURE': 'x86', 12:53:05 INFO - 'PROCESSOR_ARCHITEW6432': 'AMD64', 12:53:05 INFO - 'PROCESSOR_IDENTIFIER': 'Intel64 Family 6 Model 30 Stepping 5, GenuineIntel', 12:53:05 INFO - 'PROCESSOR_LEVEL': '6', 12:53:05 INFO - 'PROCESSOR_REVISION': '1e05', 12:53:05 INFO - 'PROGRAMDATA': 'C:\\ProgramData', 12:53:05 INFO - 'PROGRAMFILES': 'C:\\Program Files (x86)', 12:53:05 INFO - 'PROGRAMFILES(X86)': 'C:\\Program Files (x86)', 12:53:05 INFO - 'PROGRAMW6432': 'C:\\Program Files', 12:53:05 INFO - 'PROMPT': '$P$G', 12:53:05 INFO - 'PROPERTIES_FILE': 'C:\\slave\\test/buildprops.json', 12:53:05 INFO - 'PSMODULEPATH': 'C:\\windows\\system32\\WindowsPowerShell\\v1.0\\Modules\\', 12:53:05 INFO - 'PUBLIC': 'C:\\Users\\Public', 12:53:05 INFO - 'PWD': 'C:\\slave\\test', 12:53:05 INFO - 'RUNLOGFILE': 'C:\\slave\\\\runslave.log', 12:53:05 INFO - 'SLAVEDIR': 'C:\\slave\\', 12:53:05 INFO - 'SYSTEMDRIVE': 'C:', 12:53:05 INFO - 'SYSTEMROOT': 'C:\\windows', 12:53:05 INFO - 'TEMP': 'C:\\Users\\CLTBLD~1.T-W\\AppData\\Local\\Temp', 12:53:05 INFO - 'TEST1': 'testie', 12:53:05 INFO - 'TMP': 'C:\\Users\\CLTBLD~1.T-W\\AppData\\Local\\Temp', 12:53:05 INFO - 'USERDOMAIN': 'T-W864-IX-370', 12:53:05 INFO - 'USERDOMAIN_ROAMINGPROFILE': 'T-W864-IX-370', 12:53:05 INFO - 'USERNAME': 'cltbld', 12:53:05 INFO - 'USERPROFILE': 'C:\\Users\\cltbld.T-W864-IX-370', 12:53:05 INFO - 'WINDIR': 'C:\\windows', 12:53:05 INFO - 'XPCOM_DEBUG_BREAK': 'warn'} 12:53:06 INFO - Ignoring indexes: https://pypi.python.org/simple/ 12:53:06 INFO - Unpacking c:\slave\test\build\tests\mozbase\manifestparser 12:53:06 INFO - Running setup.py (path:c:\users\cltbld~1.t-w\appdata\local\temp\pip-ierx5d-build\setup.py) egg_info for package from file:///C:/slave/test/build/tests/mozbase/manifestparser 12:53:06 INFO - Unpacking c:\slave\test\build\tests\mozbase\mozcrash 12:53:06 INFO - Running setup.py (path:c:\users\cltbld~1.t-w\appdata\local\temp\pip-l5jkrx-build\setup.py) egg_info for package from file:///C:/slave/test/build/tests/mozbase/mozcrash 12:53:06 INFO - Unpacking c:\slave\test\build\tests\mozbase\mozdebug 12:53:06 INFO - Running setup.py (path:c:\users\cltbld~1.t-w\appdata\local\temp\pip-qe3jk2-build\setup.py) egg_info for package from file:///C:/slave/test/build/tests/mozbase/mozdebug 12:53:06 INFO - Unpacking c:\slave\test\build\tests\mozbase\mozdevice 12:53:06 INFO - Running setup.py (path:c:\users\cltbld~1.t-w\appdata\local\temp\pip-okemai-build\setup.py) egg_info for package from file:///C:/slave/test/build/tests/mozbase/mozdevice 12:53:06 INFO - Unpacking c:\slave\test\build\tests\mozbase\mozfile 12:53:06 INFO - Running setup.py (path:c:\users\cltbld~1.t-w\appdata\local\temp\pip-inwoei-build\setup.py) egg_info for package from file:///C:/slave/test/build/tests/mozbase/mozfile 12:53:06 INFO - Unpacking c:\slave\test\build\tests\mozbase\mozhttpd 12:53:06 INFO - Running setup.py (path:c:\users\cltbld~1.t-w\appdata\local\temp\pip-iza8iy-build\setup.py) egg_info for package from file:///C:/slave/test/build/tests/mozbase/mozhttpd 12:53:06 INFO - Unpacking c:\slave\test\build\tests\mozbase\mozinfo 12:53:06 INFO - Running setup.py (path:c:\users\cltbld~1.t-w\appdata\local\temp\pip-fnytjd-build\setup.py) egg_info for package from file:///C:/slave/test/build/tests/mozbase/mozinfo 12:53:06 INFO - Unpacking c:\slave\test\build\tests\mozbase\mozinstall 12:53:06 INFO - Running setup.py (path:c:\users\cltbld~1.t-w\appdata\local\temp\pip-xxigkm-build\setup.py) egg_info for package from file:///C:/slave/test/build/tests/mozbase/mozinstall 12:53:07 INFO - Unpacking c:\slave\test\build\tests\mozbase\mozleak 12:53:07 INFO - Running setup.py (path:c:\users\cltbld~1.t-w\appdata\local\temp\pip-jiwb9n-build\setup.py) egg_info for package from file:///C:/slave/test/build/tests/mozbase/mozleak 12:53:07 INFO - Unpacking c:\slave\test\build\tests\mozbase\mozlog 12:53:07 INFO - Running setup.py (path:c:\users\cltbld~1.t-w\appdata\local\temp\pip-69tadf-build\setup.py) egg_info for package from file:///C:/slave/test/build/tests/mozbase/mozlog 12:53:07 INFO - Unpacking c:\slave\test\build\tests\mozbase\moznetwork 12:53:07 INFO - Running setup.py (path:c:\users\cltbld~1.t-w\appdata\local\temp\pip-qfni4y-build\setup.py) egg_info for package from file:///C:/slave/test/build/tests/mozbase/moznetwork 12:53:07 INFO - Unpacking c:\slave\test\build\tests\mozbase\mozprocess 12:53:07 INFO - Running setup.py (path:c:\users\cltbld~1.t-w\appdata\local\temp\pip-mmidpk-build\setup.py) egg_info for package from file:///C:/slave/test/build/tests/mozbase/mozprocess 12:53:07 INFO - Unpacking c:\slave\test\build\tests\mozbase\mozprofile 12:53:07 INFO - Running setup.py (path:c:\users\cltbld~1.t-w\appdata\local\temp\pip-2vncrs-build\setup.py) egg_info for package from file:///C:/slave/test/build/tests/mozbase/mozprofile 12:53:07 INFO - Unpacking c:\slave\test\build\tests\mozbase\mozrunner 12:53:07 INFO - Running setup.py (path:c:\users\cltbld~1.t-w\appdata\local\temp\pip-btxt8f-build\setup.py) egg_info for package from file:///C:/slave/test/build/tests/mozbase/mozrunner 12:53:07 INFO - Unpacking c:\slave\test\build\tests\mozbase\mozscreenshot 12:53:07 INFO - Running setup.py (path:c:\users\cltbld~1.t-w\appdata\local\temp\pip-ad0l6h-build\setup.py) egg_info for package from file:///C:/slave/test/build/tests/mozbase/mozscreenshot 12:53:07 INFO - Unpacking c:\slave\test\build\tests\mozbase\moztest 12:53:07 INFO - Running setup.py (path:c:\users\cltbld~1.t-w\appdata\local\temp\pip-7b8myf-build\setup.py) egg_info for package from file:///C:/slave/test/build/tests/mozbase/moztest 12:53:07 INFO - Unpacking c:\slave\test\build\tests\mozbase\mozversion 12:53:07 INFO - Running setup.py (path:c:\users\cltbld~1.t-w\appdata\local\temp\pip-4ghxwr-build\setup.py) egg_info for package from file:///C:/slave/test/build/tests/mozbase/mozversion 12:53:08 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 12:53:08 INFO - Running setup.py install for manifestparser 12:53:08 INFO - Installing manifestparser-script.py script to C:\slave\test\build\venv\Scripts 12:53:08 INFO - Installing manifestparser.exe script to C:\slave\test\build\venv\Scripts 12:53:08 INFO - Running setup.py install for mozcrash 12:53:08 INFO - Running setup.py install for mozdebug 12:53:09 INFO - Running setup.py install for mozdevice 12:53:09 INFO - Installing sutini-script.py script to C:\slave\test\build\venv\Scripts 12:53:09 INFO - Installing sutini.exe script to C:\slave\test\build\venv\Scripts 12:53:09 INFO - Installing dm-script.py script to C:\slave\test\build\venv\Scripts 12:53:09 INFO - Installing dm.exe script to C:\slave\test\build\venv\Scripts 12:53:09 INFO - Running setup.py install for mozfile 12:53:10 INFO - Running setup.py install for mozhttpd 12:53:10 INFO - Installing mozhttpd-script.py script to C:\slave\test\build\venv\Scripts 12:53:10 INFO - Installing mozhttpd.exe script to C:\slave\test\build\venv\Scripts 12:53:10 INFO - Running setup.py install for mozinfo 12:53:11 INFO - Installing mozinfo-script.py script to C:\slave\test\build\venv\Scripts 12:53:11 INFO - Installing mozinfo.exe script to C:\slave\test\build\venv\Scripts 12:53:11 INFO - Running setup.py install for mozInstall 12:53:11 INFO - Installing moz_remove_from_system-script.py script to C:\slave\test\build\venv\Scripts 12:53:11 INFO - Installing moz_remove_from_system.exe script to C:\slave\test\build\venv\Scripts 12:53:11 INFO - Installing mozuninstall-script.py script to C:\slave\test\build\venv\Scripts 12:53:11 INFO - Installing mozuninstall.exe script to C:\slave\test\build\venv\Scripts 12:53:11 INFO - Installing mozinstall-script.py script to C:\slave\test\build\venv\Scripts 12:53:11 INFO - Installing mozinstall.exe script to C:\slave\test\build\venv\Scripts 12:53:11 INFO - Installing moz_add_to_system-script.py script to C:\slave\test\build\venv\Scripts 12:53:11 INFO - Installing moz_add_to_system.exe script to C:\slave\test\build\venv\Scripts 12:53:11 INFO - Running setup.py install for mozleak 12:53:12 INFO - Running setup.py install for mozlog 12:53:12 INFO - Installing structlog-script.py script to C:\slave\test\build\venv\Scripts 12:53:12 INFO - Installing structlog.exe script to C:\slave\test\build\venv\Scripts 12:53:13 INFO - Running setup.py install for moznetwork 12:53:13 INFO - Installing moznetwork-script.py script to C:\slave\test\build\venv\Scripts 12:53:13 INFO - Installing moznetwork.exe script to C:\slave\test\build\venv\Scripts 12:53:13 INFO - Running setup.py install for mozprocess 12:53:14 INFO - Running setup.py install for mozprofile 12:53:14 INFO - Installing mozprofile-script.py script to C:\slave\test\build\venv\Scripts 12:53:14 INFO - Installing mozprofile.exe script to C:\slave\test\build\venv\Scripts 12:53:14 INFO - Installing diff-profiles-script.py script to C:\slave\test\build\venv\Scripts 12:53:14 INFO - Installing diff-profiles.exe script to C:\slave\test\build\venv\Scripts 12:53:14 INFO - Installing view-profile-script.py script to C:\slave\test\build\venv\Scripts 12:53:14 INFO - Installing view-profile.exe script to C:\slave\test\build\venv\Scripts 12:53:14 INFO - Running setup.py install for mozrunner 12:53:14 INFO - Installing mozrunner-script.py script to C:\slave\test\build\venv\Scripts 12:53:14 INFO - Installing mozrunner.exe script to C:\slave\test\build\venv\Scripts 12:53:15 INFO - Running setup.py install for mozscreenshot 12:53:15 INFO - Running setup.py install for moztest 12:53:16 INFO - Running setup.py install for mozversion 12:53:16 INFO - Installing mozversion-script.py script to C:\slave\test\build\venv\Scripts 12:53:16 INFO - Installing mozversion.exe script to C:\slave\test\build\venv\Scripts 12:53:16 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 12:53:16 INFO - Cleaning up... 12:53:16 INFO - Return code: 0 12:53:16 INFO - Installing None into virtualenv C:\slave\test\build/venv 12:53:16 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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 12:53:16 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 12:53:16 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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 12:53:16 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 12:53:16 INFO - retry: Calling run_command with args: [['C:\\slave\\test\\build\\venv\\Scripts\\pip', 'install', '--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 0x021ED640>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x02797020>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x01D00808>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x022B5E90>, '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 0x01C6A910>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x027765C0>, '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-370', 'USERDOMAIN': 'T-W864-IX-370', '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-370', 'LOCALAPPDATA': 'C:\\Users\\cltbld.T-W864-IX-370\\AppData\\Local', 'HOMEPATH': '\\Users\\cltbld.T-W864-IX-370', 'USERDOMAIN_ROAMINGPROFILE': 'T-W864-IX-370', 'MOZBUILDDIR': 'C:\\mozilla-build\\', 'PROGRAMW6432': 'C:\\Program Files', 'USERNAME': 'cltbld', 'LOGONSERVER': '\\\\T-W864-IX-370', '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-370\\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 12:53:16 INFO - Running command: ['C:\\slave\\test\\build\\venv\\Scripts\\pip', 'install', '--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 12:53:16 INFO - Copy/paste: C:\slave\test\build\venv\Scripts\pip install --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 12:53:16 INFO - Using env: {'ALLUSERSPROFILE': 'C:\\ProgramData', 12:53:16 INFO - 'APPDATA': 'C:\\Users\\cltbld.T-W864-IX-370\\AppData\\Roaming', 12:53:16 INFO - 'COMMONPROGRAMFILES': 'C:\\Program Files (x86)\\Common Files', 12:53:16 INFO - 'COMMONPROGRAMFILES(X86)': 'C:\\Program Files (x86)\\Common Files', 12:53:16 INFO - 'COMMONPROGRAMW6432': 'C:\\Program Files\\Common Files', 12:53:16 INFO - 'COMPUTERNAME': 'T-W864-IX-370', 12:53:16 INFO - 'COMSPEC': 'C:\\windows\\system32\\cmd.exe', 12:53:16 INFO - 'DCLOCATION': 'SCL3', 12:53:16 INFO - 'DNSSUFFIX': 'wintest.releng.scl3.mozilla.com', 12:53:16 INFO - 'FP_NO_HOST_CHECK': 'NO', 12:53:16 INFO - 'HOMEDRIVE': 'C:', 12:53:16 INFO - 'HOMEPATH': '\\Users\\cltbld.T-W864-IX-370', 12:53:16 INFO - 'KTS_HOME': 'C:\\Program Files\\KTS', 12:53:16 INFO - 'KTS_VERSION': '1.19c', 12:53:16 INFO - 'LOCALAPPDATA': 'C:\\Users\\cltbld.T-W864-IX-370\\AppData\\Local', 12:53:16 INFO - 'LOGONSERVER': '\\\\T-W864-IX-370', 12:53:16 INFO - 'MONDIR': 'C:\\Monitor_config\\', 12:53:16 INFO - 'MOZBUILDDIR': 'C:\\mozilla-build\\', 12:53:16 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 12:53:16 INFO - 'MOZ_NO_REMOTE': '1', 12:53:16 INFO - 'NO_EM_RESTART': '1', 12:53:16 INFO - 'NUMBER_OF_PROCESSORS': '8', 12:53:16 INFO - 'OS': 'Windows_NT', 12:53:16 INFO - 'OURDRIVE': 'C:', 12:53:16 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', 12:53:16 INFO - 'PATHEXT': '.COM;.EXE;.BAT;.CMD;.VBS;.VBE;.JS;.JSE;.WSF;.WSH;.MSC', 12:53:16 INFO - 'PROCESSOR_ARCHITECTURE': 'x86', 12:53:16 INFO - 'PROCESSOR_ARCHITEW6432': 'AMD64', 12:53:16 INFO - 'PROCESSOR_IDENTIFIER': 'Intel64 Family 6 Model 30 Stepping 5, GenuineIntel', 12:53:16 INFO - 'PROCESSOR_LEVEL': '6', 12:53:16 INFO - 'PROCESSOR_REVISION': '1e05', 12:53:16 INFO - 'PROGRAMDATA': 'C:\\ProgramData', 12:53:16 INFO - 'PROGRAMFILES': 'C:\\Program Files (x86)', 12:53:16 INFO - 'PROGRAMFILES(X86)': 'C:\\Program Files (x86)', 12:53:16 INFO - 'PROGRAMW6432': 'C:\\Program Files', 12:53:16 INFO - 'PROMPT': '$P$G', 12:53:16 INFO - 'PROPERTIES_FILE': 'C:\\slave\\test/buildprops.json', 12:53:16 INFO - 'PSMODULEPATH': 'C:\\windows\\system32\\WindowsPowerShell\\v1.0\\Modules\\', 12:53:16 INFO - 'PUBLIC': 'C:\\Users\\Public', 12:53:16 INFO - 'PWD': 'C:\\slave\\test', 12:53:16 INFO - 'RUNLOGFILE': 'C:\\slave\\\\runslave.log', 12:53:16 INFO - 'SLAVEDIR': 'C:\\slave\\', 12:53:16 INFO - 'SYSTEMDRIVE': 'C:', 12:53:16 INFO - 'SYSTEMROOT': 'C:\\windows', 12:53:16 INFO - 'TEMP': 'C:\\Users\\CLTBLD~1.T-W\\AppData\\Local\\Temp', 12:53:16 INFO - 'TEST1': 'testie', 12:53:16 INFO - 'TMP': 'C:\\Users\\CLTBLD~1.T-W\\AppData\\Local\\Temp', 12:53:16 INFO - 'USERDOMAIN': 'T-W864-IX-370', 12:53:16 INFO - 'USERDOMAIN_ROAMINGPROFILE': 'T-W864-IX-370', 12:53:16 INFO - 'USERNAME': 'cltbld', 12:53:16 INFO - 'USERPROFILE': 'C:\\Users\\cltbld.T-W864-IX-370', 12:53:16 INFO - 'WINDIR': 'C:\\windows', 12:53:16 INFO - 'XPCOM_DEBUG_BREAK': 'warn'} 12:53:16 INFO - Ignoring indexes: https://pypi.python.org/simple/ 12:53:16 INFO - Unpacking c:\slave\test\build\tests\mozbase\manifestparser 12:53:16 INFO - Running setup.py (path:c:\users\cltbld~1.t-w\appdata\local\temp\pip-kyvs6q-build\setup.py) egg_info for package from file:///C:/slave/test/build/tests/mozbase/manifestparser 12:53:17 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)) 12:53:17 INFO - Unpacking c:\slave\test\build\tests\mozbase\mozcrash 12:53:17 INFO - Running setup.py (path:c:\users\cltbld~1.t-w\appdata\local\temp\pip-jmygly-build\setup.py) egg_info for package from file:///C:/slave/test/build/tests/mozbase/mozcrash 12:53:17 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash==1.0 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)) 12:53:17 INFO - Unpacking c:\slave\test\build\tests\mozbase\mozdebug 12:53:17 INFO - Running setup.py (path:c:\users\cltbld~1.t-w\appdata\local\temp\pip-1dicf9-build\setup.py) egg_info for package from file:///C:/slave/test/build/tests/mozbase/mozdebug 12:53:17 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)) 12:53:17 INFO - Unpacking c:\slave\test\build\tests\mozbase\mozdevice 12:53:17 INFO - Running setup.py (path:c:\users\cltbld~1.t-w\appdata\local\temp\pip-ynawpu-build\setup.py) egg_info for package from file:///C:/slave/test/build/tests/mozbase/mozdevice 12:53:17 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdevice==0.49 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)) 12:53:17 INFO - Unpacking c:\slave\test\build\tests\mozbase\mozfile 12:53:17 INFO - Running setup.py (path:c:\users\cltbld~1.t-w\appdata\local\temp\pip-tobdly-build\setup.py) egg_info for package from file:///C:/slave/test/build/tests/mozbase/mozfile 12:53:17 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)) 12:53:17 INFO - Unpacking c:\slave\test\build\tests\mozbase\mozhttpd 12:53:17 INFO - Running setup.py (path:c:\users\cltbld~1.t-w\appdata\local\temp\pip-zqzlin-build\setup.py) egg_info for package from file:///C:/slave/test/build/tests/mozbase/mozhttpd 12:53:17 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)) 12:53:17 INFO - Unpacking c:\slave\test\build\tests\mozbase\mozinfo 12:53:17 INFO - Running setup.py (path:c:\users\cltbld~1.t-w\appdata\local\temp\pip-farxeu-build\setup.py) egg_info for package from file:///C:/slave/test/build/tests/mozbase/mozinfo 12:53:17 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo==0.9 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)) 12:53:17 INFO - Unpacking c:\slave\test\build\tests\mozbase\mozinstall 12:53:17 INFO - Running setup.py (path:c:\users\cltbld~1.t-w\appdata\local\temp\pip-9p1ncs-build\setup.py) egg_info for package from file:///C:/slave/test/build/tests/mozbase/mozinstall 12:53:17 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)) 12:53:17 INFO - Unpacking c:\slave\test\build\tests\mozbase\mozleak 12:53:17 INFO - Running setup.py (path:c:\users\cltbld~1.t-w\appdata\local\temp\pip-pezto9-build\setup.py) egg_info for package from file:///C:/slave/test/build/tests/mozbase/mozleak 12:53:18 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)) 12:53:18 INFO - Unpacking c:\slave\test\build\tests\mozbase\mozlog 12:53:18 INFO - Running setup.py (path:c:\users\cltbld~1.t-w\appdata\local\temp\pip-e0vbbe-build\setup.py) egg_info for package from file:///C:/slave/test/build/tests/mozbase/mozlog 12:53:18 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog==3.4 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)) 12:53:18 INFO - Unpacking c:\slave\test\build\tests\mozbase\moznetwork 12:53:18 INFO - Running setup.py (path:c:\users\cltbld~1.t-w\appdata\local\temp\pip-5f5k67-build\setup.py) egg_info for package from file:///C:/slave/test/build/tests/mozbase/moznetwork 12:53:18 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)) 12:53:18 INFO - Unpacking c:\slave\test\build\tests\mozbase\mozprocess 12:53:18 INFO - Running setup.py (path:c:\users\cltbld~1.t-w\appdata\local\temp\pip-pu0viw-build\setup.py) egg_info for package from file:///C:/slave/test/build/tests/mozbase/mozprocess 12:53:18 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess==0.23 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)) 12:53:18 INFO - Unpacking c:\slave\test\build\tests\mozbase\mozprofile 12:53:18 INFO - Running setup.py (path:c:\users\cltbld~1.t-w\appdata\local\temp\pip-b3yg9n-build\setup.py) egg_info for package from file:///C:/slave/test/build/tests/mozbase/mozprofile 12:53:18 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile==0.28 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)) 12:53:18 INFO - Unpacking c:\slave\test\build\tests\mozbase\mozrunner 12:53:18 INFO - Running setup.py (path:c:\users\cltbld~1.t-w\appdata\local\temp\pip-hvxyj0-build\setup.py) egg_info for package from file:///C:/slave/test/build/tests/mozbase/mozrunner 12:53:18 INFO - Requirement already satisfied (use --upgrade to upgrade): mozrunner==6.13 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)) 12:53:18 INFO - Unpacking c:\slave\test\build\tests\mozbase\mozscreenshot 12:53:18 INFO - Running setup.py (path:c:\users\cltbld~1.t-w\appdata\local\temp\pip-uhdxx8-build\setup.py) egg_info for package from file:///C:/slave/test/build/tests/mozbase/mozscreenshot 12:53:18 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)) 12:53:18 INFO - Unpacking c:\slave\test\build\tests\mozbase\moztest 12:53:18 INFO - Running setup.py (path:c:\users\cltbld~1.t-w\appdata\local\temp\pip-2fwrn9-build\setup.py) egg_info for package from file:///C:/slave/test/build/tests/mozbase/moztest 12:53:19 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)) 12:53:19 INFO - Unpacking c:\slave\test\build\tests\mozbase\mozversion 12:53:19 INFO - Running setup.py (path:c:\users\cltbld~1.t-w\appdata\local\temp\pip-ysgc8l-build\setup.py) egg_info for package from file:///C:/slave/test/build/tests/mozbase/mozversion 12:53:19 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)) 12:53:19 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.0 in c:\slave\test\build\venv\lib\site-packages (from mozcrash==1.0->-r C:\slave\test\build\tests\config\mozbase_requirements.txt (line 2)) 12:53:19 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.0 in c:\slave\test\build\venv\lib\site-packages (from mozcrash==1.0->-r C:\slave\test\build\tests\config\mozbase_requirements.txt (line 2)) 12:53:19 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)) 12:53:19 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in c:\slave\test\build\venv\lib\site-packages (from mozdevice==0.49->-r C:\slave\test\build\tests\config\mozbase_requirements.txt (line 4)) 12:53:19 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.19 in c:\slave\test\build\venv\lib\site-packages (from mozdevice==0.49->-r C:\slave\test\build\tests\config\mozbase_requirements.txt (line 4)) 12:53:19 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.4->-r C:\slave\test\build\tests\config\mozbase_requirements.txt (line 10)) 12:53:19 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 12:53:19 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 12:53:20 INFO - Downloading blessings-1.6.tar.gz 12:53:20 INFO - Running setup.py (path:C:\slave\test\build\venv\build\blessings\setup.py) egg_info for package blessings 12:53:20 INFO - Installing collected packages: blessings 12:53:20 INFO - Running setup.py install for blessings 12:53:20 INFO - Successfully installed blessings 12:53:20 INFO - Cleaning up... 12:53:23 INFO - Return code: 0 12:53:23 INFO - Done creating virtualenv C:\slave\test\build/venv. 12:53:23 INFO - Getting output from command: ['C:\\slave\\test\\build\\venv\\Scripts\\pip', 'freeze'] 12:53:23 INFO - Copy/paste: C:\slave\test\build\venv\Scripts\pip freeze 12:53:23 INFO - Reading from file tmpfile_stdout 12:53:23 INFO - Using _rmtree_windows ... 12:53:23 INFO - Using _rmtree_windows ... 12:53:23 INFO - Current package versions: 12:53:23 INFO - blessings == 1.6 12:53:23 INFO - blobuploader == 1.2.4 12:53:23 INFO - docopt == 0.6.1 12:53:23 INFO - functools32 == 3.2.3-2 12:53:23 INFO - jsonschema == 2.5.1 12:53:23 INFO - manifestparser == 1.1 12:53:23 INFO - mozInstall == 1.12 12:53:23 INFO - mozcrash == 1.0 12:53:23 INFO - mozdebug == 0.1 12:53:23 INFO - mozdevice == 0.49 12:53:23 INFO - mozfile == 1.2 12:53:23 INFO - mozhttpd == 0.7 12:53:23 INFO - mozinfo == 0.9 12:53:23 INFO - mozleak == 0.1 12:53:23 INFO - mozlog == 3.4 12:53:23 INFO - moznetwork == 0.27 12:53:23 INFO - mozprocess == 0.23 12:53:23 INFO - mozprofile == 0.28 12:53:23 INFO - mozrunner == 6.13 12:53:23 INFO - mozscreenshot == 0.1 12:53:23 INFO - mozsystemmonitor == 0.3 12:53:23 INFO - moztest == 0.7 12:53:23 INFO - mozversion == 1.4 12:53:23 INFO - psutil == 3.1.1 12:53:23 INFO - requests == 1.2.3 12:53:23 INFO - Installing None into virtualenv C:\slave\test\build/venv 12:53:23 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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 12:53:23 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 12:53:23 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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 12:53:23 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 12:53:23 INFO - retry: Calling run_command with args: [['C:\\slave\\test\\build\\venv\\Scripts\\pip', 'install', '--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 0x021ED640>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x02797020>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x01D00808>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x022B5E90>, '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 0x01C6A910>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x027765C0>, '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-370', 'USERDOMAIN': 'T-W864-IX-370', '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-370', 'LOCALAPPDATA': 'C:\\Users\\cltbld.T-W864-IX-370\\AppData\\Local', 'HOMEPATH': '\\Users\\cltbld.T-W864-IX-370', 'USERDOMAIN_ROAMINGPROFILE': 'T-W864-IX-370', 'MOZBUILDDIR': 'C:\\mozilla-build\\', 'PROGRAMW6432': 'C:\\Program Files', 'USERNAME': 'cltbld', 'LOGONSERVER': '\\\\T-W864-IX-370', '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-370\\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 12:53:23 INFO - Running command: ['C:\\slave\\test\\build\\venv\\Scripts\\pip', 'install', '--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 12:53:23 INFO - Copy/paste: C:\slave\test\build\venv\Scripts\pip install --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 12:53:23 INFO - Using env: {'ALLUSERSPROFILE': 'C:\\ProgramData', 12:53:23 INFO - 'APPDATA': 'C:\\Users\\cltbld.T-W864-IX-370\\AppData\\Roaming', 12:53:23 INFO - 'COMMONPROGRAMFILES': 'C:\\Program Files (x86)\\Common Files', 12:53:23 INFO - 'COMMONPROGRAMFILES(X86)': 'C:\\Program Files (x86)\\Common Files', 12:53:23 INFO - 'COMMONPROGRAMW6432': 'C:\\Program Files\\Common Files', 12:53:23 INFO - 'COMPUTERNAME': 'T-W864-IX-370', 12:53:23 INFO - 'COMSPEC': 'C:\\windows\\system32\\cmd.exe', 12:53:23 INFO - 'DCLOCATION': 'SCL3', 12:53:23 INFO - 'DNSSUFFIX': 'wintest.releng.scl3.mozilla.com', 12:53:23 INFO - 'FP_NO_HOST_CHECK': 'NO', 12:53:23 INFO - 'HOMEDRIVE': 'C:', 12:53:23 INFO - 'HOMEPATH': '\\Users\\cltbld.T-W864-IX-370', 12:53:23 INFO - 'KTS_HOME': 'C:\\Program Files\\KTS', 12:53:23 INFO - 'KTS_VERSION': '1.19c', 12:53:23 INFO - 'LOCALAPPDATA': 'C:\\Users\\cltbld.T-W864-IX-370\\AppData\\Local', 12:53:23 INFO - 'LOGONSERVER': '\\\\T-W864-IX-370', 12:53:23 INFO - 'MONDIR': 'C:\\Monitor_config\\', 12:53:23 INFO - 'MOZBUILDDIR': 'C:\\mozilla-build\\', 12:53:23 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 12:53:23 INFO - 'MOZ_NO_REMOTE': '1', 12:53:23 INFO - 'NO_EM_RESTART': '1', 12:53:23 INFO - 'NUMBER_OF_PROCESSORS': '8', 12:53:23 INFO - 'OS': 'Windows_NT', 12:53:23 INFO - 'OURDRIVE': 'C:', 12:53:23 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', 12:53:23 INFO - 'PATHEXT': '.COM;.EXE;.BAT;.CMD;.VBS;.VBE;.JS;.JSE;.WSF;.WSH;.MSC', 12:53:23 INFO - 'PROCESSOR_ARCHITECTURE': 'x86', 12:53:23 INFO - 'PROCESSOR_ARCHITEW6432': 'AMD64', 12:53:23 INFO - 'PROCESSOR_IDENTIFIER': 'Intel64 Family 6 Model 30 Stepping 5, GenuineIntel', 12:53:23 INFO - 'PROCESSOR_LEVEL': '6', 12:53:23 INFO - 'PROCESSOR_REVISION': '1e05', 12:53:23 INFO - 'PROGRAMDATA': 'C:\\ProgramData', 12:53:23 INFO - 'PROGRAMFILES': 'C:\\Program Files (x86)', 12:53:23 INFO - 'PROGRAMFILES(X86)': 'C:\\Program Files (x86)', 12:53:23 INFO - 'PROGRAMW6432': 'C:\\Program Files', 12:53:23 INFO - 'PROMPT': '$P$G', 12:53:23 INFO - 'PROPERTIES_FILE': 'C:\\slave\\test/buildprops.json', 12:53:23 INFO - 'PSMODULEPATH': 'C:\\windows\\system32\\WindowsPowerShell\\v1.0\\Modules\\', 12:53:23 INFO - 'PUBLIC': 'C:\\Users\\Public', 12:53:23 INFO - 'PWD': 'C:\\slave\\test', 12:53:23 INFO - 'RUNLOGFILE': 'C:\\slave\\\\runslave.log', 12:53:23 INFO - 'SLAVEDIR': 'C:\\slave\\', 12:53:23 INFO - 'SYSTEMDRIVE': 'C:', 12:53:23 INFO - 'SYSTEMROOT': 'C:\\windows', 12:53:23 INFO - 'TEMP': 'C:\\Users\\CLTBLD~1.T-W\\AppData\\Local\\Temp', 12:53:23 INFO - 'TEST1': 'testie', 12:53:23 INFO - 'TMP': 'C:\\Users\\CLTBLD~1.T-W\\AppData\\Local\\Temp', 12:53:23 INFO - 'USERDOMAIN': 'T-W864-IX-370', 12:53:23 INFO - 'USERDOMAIN_ROAMINGPROFILE': 'T-W864-IX-370', 12:53:23 INFO - 'USERNAME': 'cltbld', 12:53:23 INFO - 'USERPROFILE': 'C:\\Users\\cltbld.T-W864-IX-370', 12:53:23 INFO - 'WINDIR': 'C:\\windows', 12:53:23 INFO - 'XPCOM_DEBUG_BREAK': 'warn'} 12:53:24 INFO - Ignoring indexes: https://pypi.python.org/simple/ 12:53:24 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.1 in c:\slave\test\build\venv\lib\site-packages (from -r C:\slave\test\build\tests\talos\requirements.txt (line 1)) 12:53:24 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 2)) 12:53:24 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 3)) 12:53:24 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 4)) 12:53:24 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 5)) 12:53:24 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 6)) 12:53:24 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 7)) 12:53:24 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 8)) 12:53:24 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 9)) 12:53:24 INFO - Requirement already satisfied (use --upgrade to upgrade): blessings>=1.3 in c:\slave\test\build\venv\lib\site-packages (from mozlog>=3.1->-r C:\slave\test\build\tests\talos\requirements.txt (line 1)) 12:53:24 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 4)) 12:53:24 INFO - Cleaning up... 12:53:24 INFO - Return code: 0 12:53:24 INFO - Installing jsonschema into virtualenv C:\slave\test\build/venv 12:53:24 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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 12:53:24 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 12:53:24 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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 12:53:24 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 12:53:24 INFO - retry: Calling run_command with args: [['C:\\slave\\test\\build\\venv\\Scripts\\pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x021ED640>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x02797020>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x01D00808>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x022B5E90>, '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 0x01C6A910>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x027765C0>, 'level': 'critical'}], 'cwd': 'C:\\slave\\test\\build', 'env': {'TMP': 'C:\\Users\\CLTBLD~1.T-W\\AppData\\Local\\Temp', 'TEST1': 'testie', 'COMPUTERNAME': 'T-W864-IX-370', 'USERDOMAIN': 'T-W864-IX-370', '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-370', 'LOCALAPPDATA': 'C:\\Users\\cltbld.T-W864-IX-370\\AppData\\Local', 'HOMEPATH': '\\Users\\cltbld.T-W864-IX-370', 'USERDOMAIN_ROAMINGPROFILE': 'T-W864-IX-370', 'MOZBUILDDIR': 'C:\\mozilla-build\\', 'PROGRAMW6432': 'C:\\Program Files', 'USERNAME': 'cltbld', 'LOGONSERVER': '\\\\T-W864-IX-370', '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-370\\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 12:53:24 INFO - Running command: ['C:\\slave\\test\\build\\venv\\Scripts\\pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema'] in C:\slave\test\build 12:53:24 INFO - Copy/paste: C:\slave\test\build\venv\Scripts\pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema 12:53:24 INFO - Using env: {'ALLUSERSPROFILE': 'C:\\ProgramData', 12:53:24 INFO - 'APPDATA': 'C:\\Users\\cltbld.T-W864-IX-370\\AppData\\Roaming', 12:53:24 INFO - 'COMMONPROGRAMFILES': 'C:\\Program Files (x86)\\Common Files', 12:53:24 INFO - 'COMMONPROGRAMFILES(X86)': 'C:\\Program Files (x86)\\Common Files', 12:53:24 INFO - 'COMMONPROGRAMW6432': 'C:\\Program Files\\Common Files', 12:53:24 INFO - 'COMPUTERNAME': 'T-W864-IX-370', 12:53:24 INFO - 'COMSPEC': 'C:\\windows\\system32\\cmd.exe', 12:53:24 INFO - 'DCLOCATION': 'SCL3', 12:53:24 INFO - 'DNSSUFFIX': 'wintest.releng.scl3.mozilla.com', 12:53:24 INFO - 'FP_NO_HOST_CHECK': 'NO', 12:53:24 INFO - 'HOMEDRIVE': 'C:', 12:53:24 INFO - 'HOMEPATH': '\\Users\\cltbld.T-W864-IX-370', 12:53:24 INFO - 'KTS_HOME': 'C:\\Program Files\\KTS', 12:53:24 INFO - 'KTS_VERSION': '1.19c', 12:53:24 INFO - 'LOCALAPPDATA': 'C:\\Users\\cltbld.T-W864-IX-370\\AppData\\Local', 12:53:24 INFO - 'LOGONSERVER': '\\\\T-W864-IX-370', 12:53:24 INFO - 'MONDIR': 'C:\\Monitor_config\\', 12:53:24 INFO - 'MOZBUILDDIR': 'C:\\mozilla-build\\', 12:53:24 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 12:53:24 INFO - 'MOZ_NO_REMOTE': '1', 12:53:24 INFO - 'NO_EM_RESTART': '1', 12:53:24 INFO - 'NUMBER_OF_PROCESSORS': '8', 12:53:24 INFO - 'OS': 'Windows_NT', 12:53:24 INFO - 'OURDRIVE': 'C:', 12:53:24 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', 12:53:24 INFO - 'PATHEXT': '.COM;.EXE;.BAT;.CMD;.VBS;.VBE;.JS;.JSE;.WSF;.WSH;.MSC', 12:53:24 INFO - 'PROCESSOR_ARCHITECTURE': 'x86', 12:53:24 INFO - 'PROCESSOR_ARCHITEW6432': 'AMD64', 12:53:24 INFO - 'PROCESSOR_IDENTIFIER': 'Intel64 Family 6 Model 30 Stepping 5, GenuineIntel', 12:53:24 INFO - 'PROCESSOR_LEVEL': '6', 12:53:24 INFO - 'PROCESSOR_REVISION': '1e05', 12:53:24 INFO - 'PROGRAMDATA': 'C:\\ProgramData', 12:53:24 INFO - 'PROGRAMFILES': 'C:\\Program Files (x86)', 12:53:24 INFO - 'PROGRAMFILES(X86)': 'C:\\Program Files (x86)', 12:53:24 INFO - 'PROGRAMW6432': 'C:\\Program Files', 12:53:24 INFO - 'PROMPT': '$P$G', 12:53:24 INFO - 'PROPERTIES_FILE': 'C:\\slave\\test/buildprops.json', 12:53:24 INFO - 'PSMODULEPATH': 'C:\\windows\\system32\\WindowsPowerShell\\v1.0\\Modules\\', 12:53:24 INFO - 'PUBLIC': 'C:\\Users\\Public', 12:53:24 INFO - 'PWD': 'C:\\slave\\test', 12:53:24 INFO - 'RUNLOGFILE': 'C:\\slave\\\\runslave.log', 12:53:24 INFO - 'SLAVEDIR': 'C:\\slave\\', 12:53:24 INFO - 'SYSTEMDRIVE': 'C:', 12:53:24 INFO - 'SYSTEMROOT': 'C:\\windows', 12:53:24 INFO - 'TEMP': 'C:\\Users\\CLTBLD~1.T-W\\AppData\\Local\\Temp', 12:53:24 INFO - 'TEST1': 'testie', 12:53:24 INFO - 'TMP': 'C:\\Users\\CLTBLD~1.T-W\\AppData\\Local\\Temp', 12:53:24 INFO - 'USERDOMAIN': 'T-W864-IX-370', 12:53:24 INFO - 'USERDOMAIN_ROAMINGPROFILE': 'T-W864-IX-370', 12:53:24 INFO - 'USERNAME': 'cltbld', 12:53:24 INFO - 'USERPROFILE': 'C:\\Users\\cltbld.T-W864-IX-370', 12:53:24 INFO - 'WINDIR': 'C:\\windows', 12:53:24 INFO - 'XPCOM_DEBUG_BREAK': 'warn'} 12:53:24 INFO - Ignoring indexes: https://pypi.python.org/simple/ 12:53:24 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in c:\slave\test\build\venv\lib\site-packages 12:53:24 INFO - Cleaning up... 12:53:24 INFO - Return code: 0 12:53:24 INFO - Running post-action listener: _resource_record_post_action 12:53:24 INFO - Running post-action listener: _start_resource_monitoring 12:53:24 INFO - Starting resource monitoring. 12:53:24 INFO - [mozharness: 2016-11-22 20:53:24.613000Z] Finished create-virtualenv step (success) 12:53:24 INFO - [mozharness: 2016-11-22 20:53:24.613000Z] Running install step. 12:53:24 INFO - Running pre-action listener: _resource_record_pre_action 12:53:24 INFO - Running main action method: install 12:53:24 INFO - Getting output from command: ['C:\\slave\\test\\build\\venv\\Scripts\\pip', 'freeze'] 12:53:24 INFO - Copy/paste: C:\slave\test\build\venv\Scripts\pip freeze 12:53:24 INFO - Reading from file tmpfile_stdout 12:53:24 INFO - Using _rmtree_windows ... 12:53:24 INFO - Using _rmtree_windows ... 12:53:24 INFO - Detecting whether we're running mozinstall >=1.0... 12:53:24 INFO - Getting output from command: ['C:\\slave\\test\\build/venv/scripts/python', 'C:\\slave\\test\\build/venv/scripts/mozinstall-script.py', '-h'] 12:53:24 INFO - Copy/paste: C:\slave\test\build/venv/scripts/python C:\slave\test\build/venv/scripts/mozinstall-script.py -h 12:53:25 INFO - Reading from file tmpfile_stdout 12:53:25 INFO - Output received: 12:53:25 INFO - Usage: mozinstall-script.py [options] installer 12:53:25 INFO - Options: 12:53:25 INFO - -h, --help show this help message and exit 12:53:25 INFO - -d DEST, --destination=DEST 12:53:25 INFO - Directory to install application into. [default: 12:53:25 INFO - "C:\slave\test"] 12:53:25 INFO - --app=APP Application being installed. [default: firefox] 12:53:25 INFO - Using _rmtree_windows ... 12:53:25 INFO - Using _rmtree_windows ... 12:53:25 INFO - mkdir: C:\slave\test\build\application 12:53:25 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-53.0a1.en-US.win64.zip', '--destination', 'C:\\slave\\test\\build\\application'] 12:53:25 INFO - Copy/paste: C:\slave\test\build/venv/scripts/python C:\slave\test\build/venv/scripts/mozinstall-script.py C:\slave\test\build\firefox-53.0a1.en-US.win64.zip --destination C:\slave\test\build\application ProcessManager NOT managing child processes 12:53:27 INFO - Reading from file tmpfile_stdout 12:53:27 INFO - Output received: 12:53:27 INFO - C:\slave\test\build\application\firefox\firefox.exe 12:53:27 INFO - Using _rmtree_windows ... 12:53:27 INFO - Using _rmtree_windows ... 12:53:27 INFO - Running post-action listener: _resource_record_post_action 12:53:27 INFO - [mozharness: 2016-11-22 20:53:27.244000Z] Finished install step (success) 12:53:27 INFO - [mozharness: 2016-11-22 20:53:27.244000Z] Running run-tests step. 12:53:27 INFO - Running pre-action listener: _resource_record_pre_action 12:53:27 INFO - Running main action method: run_tests 12:53:27 INFO - Running command: ['C:\\slave\\test\\build\\venv\\Scripts\\python', '--version'] 12:53:27 INFO - Copy/paste: C:\slave\test\build\venv\Scripts\python --version 12:53:27 INFO - Python 2.7.3 12:53:27 INFO - Return code: 0 12:53:27 INFO - grabbing minidump binary from tooltool 12:53:27 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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 12:53:27 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: {'output_timeout': 600, 'error_list': [{'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x022B5E90>, '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 0x01C6A910>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x027765C0>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': 'C:\\slave\\test\\build', 'privileged': False}, attempt #1 12:53:27 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 12:53:27 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 12:53:27 INFO - Calling ['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'] with output_timeout 600 ProcessManager UNABLE to use job objects to manage child processes 12:53:27 INFO - INFO - Attempting to fetch from 'https://api.pub.build.mozilla.org/tooltool/'... 12:53:28 INFO - INFO - File win32-minidump_stackwalk.exe fetched from https://api.pub.build.mozilla.org/tooltool/ as C:\slave\test\build\tmpnpmx6w 12:53:28 INFO - INFO - File integrity verified, renaming tmpnpmx6w to win32-minidump_stackwalk.exe 12:53:29 INFO - Return code: 0 12:53:29 INFO - Chmoding C:\slave\test\build\win32-minidump_stackwalk.exe to 0755 12:53:29 INFO - mkdir: C:\slave\test\build\blobber_upload_dir 12:53:29 INFO - ENV: MOZ_UPLOAD_DIR is now C:\slave\test\build\blobber_upload_dir 12:53:29 INFO - ENV: MINIDUMP_STACKWALK is now C:\slave\test\build\win32-minidump_stackwalk.exe 12:53:29 INFO - ENV: MINIDUMP_SAVE_PATH is now C:\slave\test\build\blobber_upload_dir 12:53:29 INFO - Running command: ['C:\\slave\\test\\build\\venv\\Scripts\\python', 'C:\\slave\\test\\build\\tests\\talos\\talos\\run_tests.py', '--branchName', 'Graphics', '--suite', 'dromaeojs', '--executablePath', 'C:\\slave\\test\\build\\application\\firefox\\firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/WfBlHjtkQWqKdJi7pskhXA/artifacts/public/build/firefox-53.0a1.en-US.win64.crashreporter-symbols.zip', '--title', 'T-W864-IX-370', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=C:\\slave\\test\\build\\blobber_upload_dir\\dromaeojs_errorsummary.log', '--log-raw=C:\\slave\\test\\build\\blobber_upload_dir\\dromaeojs_raw.log'] in C:\slave\test\build 12:53:29 INFO - Copy/paste: C:\slave\test\build\venv\Scripts\python C:\slave\test\build\tests\talos\talos\run_tests.py --branchName Graphics --suite dromaeojs --executablePath C:\slave\test\build\application\firefox\firefox --symbolsPath https://queue.taskcluster.net/v1/task/WfBlHjtkQWqKdJi7pskhXA/artifacts/public/build/firefox-53.0a1.en-US.win64.crashreporter-symbols.zip --title T-W864-IX-370 --webServer localhost --log-tbpl-level=debug --log-errorsummary=C:\slave\test\build\blobber_upload_dir\dromaeojs_errorsummary.log --log-raw=C:\slave\test\build\blobber_upload_dir\dromaeojs_raw.log 12:53:29 INFO - Using env: {'ALLUSERSPROFILE': 'C:\\ProgramData', 12:53:29 INFO - 'APPDATA': 'C:\\Users\\cltbld.T-W864-IX-370\\AppData\\Roaming', 12:53:29 INFO - 'COMMONPROGRAMFILES': 'C:\\Program Files (x86)\\Common Files', 12:53:29 INFO - 'COMMONPROGRAMFILES(X86)': 'C:\\Program Files (x86)\\Common Files', 12:53:29 INFO - 'COMMONPROGRAMW6432': 'C:\\Program Files\\Common Files', 12:53:29 INFO - 'COMPUTERNAME': 'T-W864-IX-370', 12:53:29 INFO - 'COMSPEC': 'C:\\windows\\system32\\cmd.exe', 12:53:29 INFO - 'DCLOCATION': 'SCL3', 12:53:29 INFO - 'DNSSUFFIX': 'wintest.releng.scl3.mozilla.com', 12:53:29 INFO - 'FP_NO_HOST_CHECK': 'NO', 12:53:29 INFO - 'HOMEDRIVE': 'C:', 12:53:29 INFO - 'HOMEPATH': '\\Users\\cltbld.T-W864-IX-370', 12:53:29 INFO - 'KTS_HOME': 'C:\\Program Files\\KTS', 12:53:29 INFO - 'KTS_VERSION': '1.19c', 12:53:29 INFO - 'LOCALAPPDATA': 'C:\\Users\\cltbld.T-W864-IX-370\\AppData\\Local', 12:53:29 INFO - 'LOGONSERVER': '\\\\T-W864-IX-370', 12:53:29 INFO - 'MINIDUMP_SAVE_PATH': 'C:\\slave\\test\\build\\blobber_upload_dir', 12:53:29 INFO - 'MINIDUMP_STACKWALK': 'C:\\slave\\test\\build\\win32-minidump_stackwalk.exe', 12:53:29 INFO - 'MONDIR': 'C:\\Monitor_config\\', 12:53:29 INFO - 'MOZBUILDDIR': 'C:\\mozilla-build\\', 12:53:29 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 12:53:29 INFO - 'MOZ_NO_REMOTE': '1', 12:53:29 INFO - 'MOZ_UPLOAD_DIR': 'C:\\slave\\test\\build\\blobber_upload_dir', 12:53:29 INFO - 'NO_EM_RESTART': '1', 12:53:29 INFO - 'NUMBER_OF_PROCESSORS': '8', 12:53:29 INFO - 'OS': 'Windows_NT', 12:53:29 INFO - 'OURDRIVE': 'C:', 12:53:29 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', 12:53:29 INFO - 'PATHEXT': '.COM;.EXE;.BAT;.CMD;.VBS;.VBE;.JS;.JSE;.WSF;.WSH;.MSC', 12:53:29 INFO - 'PROCESSOR_ARCHITECTURE': 'x86', 12:53:29 INFO - 'PROCESSOR_ARCHITEW6432': 'AMD64', 12:53:29 INFO - 'PROCESSOR_IDENTIFIER': 'Intel64 Family 6 Model 30 Stepping 5, GenuineIntel', 12:53:29 INFO - 'PROCESSOR_LEVEL': '6', 12:53:29 INFO - 'PROCESSOR_REVISION': '1e05', 12:53:29 INFO - 'PROGRAMDATA': 'C:\\ProgramData', 12:53:29 INFO - 'PROGRAMFILES': 'C:\\Program Files (x86)', 12:53:29 INFO - 'PROGRAMFILES(X86)': 'C:\\Program Files (x86)', 12:53:29 INFO - 'PROGRAMW6432': 'C:\\Program Files', 12:53:29 INFO - 'PROMPT': '$P$G', 12:53:29 INFO - 'PROPERTIES_FILE': 'C:\\slave\\test/buildprops.json', 12:53:29 INFO - 'PSMODULEPATH': 'C:\\windows\\system32\\WindowsPowerShell\\v1.0\\Modules\\', 12:53:29 INFO - 'PUBLIC': 'C:\\Users\\Public', 12:53:29 INFO - 'PWD': 'C:\\slave\\test', 12:53:29 INFO - 'PYTHONPATH': 'C:\\slave\\test\\build\\tests\\talos', 12:53:29 INFO - 'RUNLOGFILE': 'C:\\slave\\\\runslave.log', 12:53:29 INFO - 'SLAVEDIR': 'C:\\slave\\', 12:53:29 INFO - 'SYSTEMDRIVE': 'C:', 12:53:29 INFO - 'SYSTEMROOT': 'C:\\windows', 12:53:29 INFO - 'TEMP': 'C:\\Users\\CLTBLD~1.T-W\\AppData\\Local\\Temp', 12:53:29 INFO - 'TEST1': 'testie', 12:53:29 INFO - 'TMP': 'C:\\Users\\CLTBLD~1.T-W\\AppData\\Local\\Temp', 12:53:29 INFO - 'USERDOMAIN': 'T-W864-IX-370', 12:53:29 INFO - 'USERDOMAIN_ROAMINGPROFILE': 'T-W864-IX-370', 12:53:29 INFO - 'USERNAME': 'cltbld', 12:53:29 INFO - 'USERPROFILE': 'C:\\Users\\cltbld.T-W864-IX-370', 12:53:29 INFO - 'WINDIR': 'C:\\windows', 12:53:29 INFO - 'XPCOM_DEBUG_BREAK': 'warn'} 12:53:29 INFO - Calling ['C:\\slave\\test\\build\\venv\\Scripts\\python', 'C:\\slave\\test\\build\\tests\\talos\\talos\\run_tests.py', '--branchName', 'Graphics', '--suite', 'dromaeojs', '--executablePath', 'C:\\slave\\test\\build\\application\\firefox\\firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/WfBlHjtkQWqKdJi7pskhXA/artifacts/public/build/firefox-53.0a1.en-US.win64.crashreporter-symbols.zip', '--title', 'T-W864-IX-370', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=C:\\slave\\test\\build\\blobber_upload_dir\\dromaeojs_errorsummary.log', '--log-raw=C:\\slave\\test\\build\\blobber_upload_dir\\dromaeojs_raw.log'] with output_timeout 3600 ProcessManager NOT managing child processes ProcessManager UNABLE to use job objects to manage child processes 12:53:29 INFO - mozversion application_buildid: 20161122113650 12:53:29 INFO - mozversion application_changeset: 4cf8741bb86f96dcb62dc98594f109e7ed2733a1 12:53:29 INFO - mozversion application_display_name: Nightly 12:53:29 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 12:53:29 INFO - mozversion application_name: Firefox 12:53:29 INFO - mozversion application_remotingname: firefox 12:53:29 INFO - mozversion application_repository: https://hg.mozilla.org/projects/graphics 12:53:29 INFO - mozversion application_vendor: Mozilla 12:53:29 INFO - mozversion application_version: 53.0a1 12:53:29 INFO - mozversion platform_buildid: 20161122113650 12:53:29 INFO - mozversion platform_changeset: 4cf8741bb86f96dcb62dc98594f109e7ed2733a1 12:53:29 INFO - mozversion platform_repository: https://hg.mozilla.org/projects/graphics 12:53:29 INFO - mozversion platform_version: 53.0a1 12:53:29 INFO - using testdate: 1479848009 12:53:29 INFO - actual date: 1479848009 12:53:29 INFO - starting webserver on 'localhost:49276' 12:53:29 INFO - SUITE-START | Running 2 tests 12:53:29 INFO - TEST-START | dromaeo_css 12:53:29 INFO - operating with platform_type : w8_ 12:53:29 INFO - Initialising browser for dromaeo_css test... 12:53:30 INFO - TEST-INFO | started process 2728 (C:\slave\test\build\application\firefox\firefox -profile c:\users\cltbld~1.t-w\appdata\local\temp\tmpxkby3h\profile http://localhost:49276/getInfo.html) 12:53:37 INFO - PROCESS | 2728 | __metrics Screen width/height:1600/1200 12:53:37 INFO - PROCESS | 2728 | colorDepth:24 12:53:37 INFO - PROCESS | 2728 | Browser inner width/height: 1010/674 12:53:37 INFO - PROCESS | 2728 | __metrics 12:53:38 INFO - PROCESS | 2728 | JavaScript error: resource://gre/modules/AsyncShutdown.jsm, line 692: Error: Phase "quit-application-granted" is finished, it is too late to register completion condition "SessionStore: flushing all windows" 12:53:38 INFO - PROCESS | 2728 | JavaScript error: resource://app/modules/BrowserUsageTelemetry.jsm, line 211: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 12:53:40 INFO - TEST-INFO | 2728: exit 0 12:53:40 INFO - Browser initialized. 12:53:40 INFO - Running cycle 1/1 for dromaeo_css test... 12:53:40 INFO - TEST-INFO | started process 3672 (C:\slave\test\build\application\firefox\firefox -profile c:\users\cltbld~1.t-w\appdata\local\temp\tmpxkby3h\profile -tp file:\C:\slave\test\build\tests\talos\talos\tests\dromaeo\css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 12:53:40 INFO - PROCESS | 3672 | [GFX1-]: Invalid size in UpdateRenderTarget Size(124,0), 0 12:53:51 INFO - PROCESS | 3672 | RSS: Main: 174350336 12:53:51 INFO - PROCESS | 3672 | 12:54:42 INFO - PROCESS | 3672 | 1479848082656 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] 12:56:54 INFO - PROCESS | 3672 | Cycle 1(1): loaded http://localhost:49276/tests/dromaeo/cssquery-dojo.html (next: http://localhost:49276/tests/dromaeo/cssquery-ext.html) 12:56:56 INFO - PROCESS | 3672 | RSS: Main: 243200000 12:56:56 INFO - PROCESS | 3672 | 12:59:59 INFO - PROCESS | 3672 | Cycle 1(1): loaded http://localhost:49276/tests/dromaeo/cssquery-ext.html (next: http://localhost:49276/tests/dromaeo/cssquery-jquery.html) 13:00:00 INFO - PROCESS | 3672 | RSS: Main: 237301760 13:00:00 INFO - PROCESS | 3672 | 13:03:02 INFO - PROCESS | 3672 | Cycle 1(1): loaded http://localhost:49276/tests/dromaeo/cssquery-jquery.html (next: http://localhost:49276/tests/dromaeo/cssquery-mootools.html) 13:03:03 INFO - PROCESS | 3672 | RSS: Main: 180723712 13:03:03 INFO - PROCESS | 3672 | 13:06:05 INFO - PROCESS | 3672 | Cycle 1(1): loaded http://localhost:49276/tests/dromaeo/cssquery-mootools.html (next: http://localhost:49276/tests/dromaeo/cssquery-prototype.html) 13:06:06 INFO - PROCESS | 3672 | RSS: Main: 173314048 13:06:06 INFO - PROCESS | 3672 | 13:09:09 INFO - PROCESS | 3672 | Cycle 1(1): loaded http://localhost:49276/tests/dromaeo/cssquery-prototype.html (next: http://localhost:49276/tests/dromaeo/cssquery-yui.html) 13:09:10 INFO - PROCESS | 3672 | RSS: Main: 171991040 13:09:10 INFO - PROCESS | 3672 | 13:12:13 INFO - PROCESS | 3672 | Cycle 1(1): loaded http://localhost:49276/tests/dromaeo/cssquery-yui.html (next: http://localhost:49276/tests/dromaeo/cssquery-dojo.html) 13:12:13 INFO - PROCESS | 3672 | RSS: Main: 214712320 13:12:13 INFO - PROCESS | 3672 | 13:12:13 INFO - PROCESS | 3672 | __start_tp_report 13:12:13 INFO - PROCESS | 3672 | _x_x_mozilla_page_load 13:12:13 INFO - PROCESS | 3672 | _x_x_mozilla_page_load_details 13:12:13 INFO - PROCESS | 3672 | |i|pagename|runs| 13:12:13 INFO - PROCESS | 3672 | |0;dojo.html;2313.733920599131;2585.715571287158;2628.093307808805;2644.299260695916;2667.5465170920943;4431.423914891059;4432.423784907962;4435.756033418161;4439.755813430264;4467.821287148518;4176.853810116647;4327.26436505794;4406.074724307891;4418.403515525403;4475.060237350152;3980.6417422431973;3999.0802115513447;4010.578889216634;4013.739106958053;4045.474088368508;4013.4983127109113;4050.6759459243335;4059.7158198926086;4061.390791381287;4066.573009833969;3996.6802655787615;4027.154297597508;4031.5363733170766;4032.112935154276;4053.310937140693;4000.7599544027307;4051.149258655686;4080.6735461163034;4081.469408976814;4122.793860307002;3916.4321173429694;3931.469251651019;4031.23406552754;4043.514778226602;4104.589541045902;4300.268954277781;4319.76241306728;4327.285997810358;4340.023494713696;4345.2613055780275;4534.86395408135;4541.818327266906;4587.79354929029;4609.9308510372375;4621.607163391116;4454.443194600675;4515.412996310459;4562.247229207177;4612.515685852971;4672.4393072831135;4079.0414252650603;4176.31090870003;4184.769837658958;4245.893852653678;4247.299195632748;4615.100055489147;4654.534546545387;4677.438707355139;4691.695039822401;4748.453927798348;4398.846040388571;4406.515283318832;4423.756693381895;4430.534793846664;4447.533009034005;4282.164977829356;4302.096559722493;4470.597646211857;4476.037651904791;4480.865574032784;4271.209826182167;4290.399344091829;4303.978480107579;4315.697901146952;4319.632831209319;4199.97900010498;4204.936925946114;4215.662746980234;4266.104118135165;4293.677974151951;2854.5147324954805;2930.575066615329;2933.3546619744047;2951.9409611808073;2955.6305461817274;2614.4248265381584;2715.579085241791;2757.241758516424;2762.8618569071464;2767.1421859223706;4107.199096176217;4119.485064366954;4119.9176016480105;4161.167766446662;4182.53992060873;4152.045029643199;4160.251154792167;4170.77060761655;4180.7909604519655;4353.303471444617;3911.5697273299916;3928.2929072766606;3931.1548017176447;3951.209758048402;3993.5008123984503;3513.332466831345;3531.3820081485637;3544.521489598923;3551.5027896094566;3562.1985053362787;4254.659627229876;4255.170241802881;4257.723247988871;4286.828526858953;4293.978530107392;3979.422983667294;4219.6202341789385;4220.303649897733;4231.449423369168;4311.913761724811;4102.99476628228;4119.217348703737;4130.339145736788;4136.627703506579;4195.8741237762915;4066.207089617496;4102.692298077716;4130.814113364966;4150.605692459211;4192.45498085247;4144.52337981136;4178.331466965393;4221;4221.831126755018;4368.628666563378;4026.4966879140106;4051.777152256654;4072.6131017553284;4103.322951712934;4201.033762234642;3941.7437866538585;3951.881443556698;3976.085500334997;3978.602139785998;4032.5362583303295;3900.4929359183125;3966.8016599170505;3968.325384684553;4029.91940161201;4052.675785937177;4012.5586185518987;4057.0871553901316;4063.553009169048;4068.413318805609;4173.728707633994;3832.2718683450057;3868;3895.668868146126;3919.627635374635;3939.763614183158 13:12:13 INFO - PROCESS | 3672 | |1;ext.html;473.38696388177306;478.3183962852935;486.652043788691;489.94365647950497;491;22754.089836406543;29654.851725741395;30721;30850.074497765076;31277.687223127763;29877.701222987762;30264.394712105746;30297.242568935788;30853.38293234134;30975.69024309762;6033.09503574463;6571.769988050407;6676.098726671886;6677.933220667804;6726.529142959995;5972.522198224132;7707.537547747125;7886.6845326186885;8008.399370047241;8070.798230044237;8016.599170041503;8049.959750201241;8111.310538604226;8121.95939020307;8172.550509721963;6136.355682653302;6292.307846136921;7907.762767116967;7943.205679432069;7983.0420349558135;7767.262110099531;8122.106568277485;8126.715564955198;8133.2680058794995;8308.044574873846;27968.720312796817;28170.436591268266;28359.716402835915;28533.85733071342;28552.143435696962;2466.4573793765344;2697.150397624742;2775.9444811103663;2859.4138201668816;3002.1293824790782;21859.344219673436;21905.342839714835;21925.671114933288;22010.88994555033;22312.88843555788;2837.4394083254333;3054;3065.1570818024998;3122.4535706251313;3209.7321557984465;180538;180630;180876.9999999987;181713;181914;40457.59542404538;41130.58869411328;41274.793626032275;41295.79352103281;41348.73025394873;24952.754252117396;25675.614865777028;25718;26971.190864274104;27009.459810803673;11258.380789056517;11332.2067455279;11360.715982100513;11368.147388945863;11404.942975285236;7719.845603088019;7979.324341888152;8279.917200828035;8448.662053517914;8638.654453821777;13289.269090200132;13755.38100785467;13785.931070344584;13815.309234538434;13872.4451021958;5604.8318550443555;5660;5673.177389278531;5688.943110568925;5764.365919748824;689.5932298111896;717.5838013951895;734.4454936522891;761.1741260732057;840.0717207485762;21637.675434868488;22219.55560888773;22343.217987370364;22564.323070307917;22655.660165097535;803.148662417839;803.1526739290105;814.7515007922641;851.4848516647463;898.6719847255705;11676.532938682527;12287.324197169062;12452.81320780189;13131.810963255077;13434.462621495226;250703;261259;262698;263020;264940;38979;39287.60712392897;39581.80209098936;40237;40843.795781020905;928.9814203715888;939.2861425316672;953.0993211415146;1006.7382480555109;1016.0499932563077;20973;22995.88502057479;23501.529969400857;24344.634830477913;24654.753452465247;35497;35600;36844.447333289485;37666.811665941495;38098.7612353663;223643;235819;236316;237173;238681;16657.167141643113;17624.91187544054;18867.622647546697;19166.616667666847;19429.417117486497;31645.525317119802;31732;31991.84004079965;32021.519677205328;32320.515192271665;26380.8680956594;26704.19887403381;27216.72783272142;27295.45409091847;27850.721492784814;26071.348216293987;26169.214923552325;29634;30154.84922575373;30191.849040754656;27938.86030569834;28289.29276768015;28731.569026465037;28830;29194;22575.322740317817;24208.63687044731;24961.12636057802;25823.354416139748;26091.478170436105;18445.815541844946;18978.905105474383;18995.71506427377;20104.59790804205;20157.193712251934 13:12:13 INFO - PROCESS | 3672 | |2;jquery.html;257.33863969598116;283.2522141546318;283.7389601566559;290.1773472206295;292.3013996548249;10133;10974;10995.34027958323;11193.944030279858;11229.157813164005;9958.15355694765;10861.782764344729;11913.821292680617;12229.877701222986;12314;3965.6034396560403;4227.534971153171;4231.280682284019;4248.022954720416;4280.293751530994;3953.2884080865433;4052.331365324718;4130.421740956269;4131.772752498611;4142.068034692185;4123.154753275571;4142.233686767958;4146.606072423115;4156.709030367861;4177.415161877339;4123.649489793341;4136.131412403399;4138.627523522882;4140;4146.170765846812;3367.040393487844;3589.74871758977;3635.163912300159;3646.778329259701;3657.88434527469;8189.303909167728;8242.381821363362;8323.625436855296;8392.580370981426;8547;1470.897037207396;1493.3429291111877;1516;1575.070708282119;1875.5498680316625;6004.309504407005;6269.655168965705;6287.811365658992;6556.3443655634055;6567.9671601641685;1277.329402063924;1310.0502135951358;1322.6494978830522;1343.1068339554283;1380.0546625561522;47723.52276477226;48298;48457;48568.99999999964;48944.51055489471;7467.663955122032;7529.247075292427;7614.048243969393;7641.197674244236;7739.342155916697;9881.703548893545;9932.404055756677;9939.403635781877;9939.602415903282;10123.44321062334;4526.683132180781;4828.589569886529;5090.26191202281;5333.8133165339805;5442.510174084351;5221.477852214824;5385.299911011622;5407.594430417735;5412.675239485643;5464.453554644504;2949.2626843289177;2959.6596391414832;2999.1902186409548;3171.7462602991704;3247.8213698246823;1285.1004296992144;1326.8739469750358;1329.4217015598247;1336.458734212626;1345.8855997240148;640.6348381422638;674.919009718827;711.1801706234701;727.8871774874902;734.474850481908;12951.417186226643;13093.869061309455;13295.401706923212;13473;13511.729765404636;637.1366797988751;679.78926532775;705.0376236437329;713.4221280762599;748.5433885329944;6897.275786042494;7327.047483827068;7390.260973902674;7461.179270280265;7592.962035189788;233151;246285;246435;246856;250182;55740.72129639407;55804.44195558074;56355;57982.7100864493;59015.70492147512;640.6028262477294;675.7195763757985;676.6041865508635;678.4945215814151;684.7397988764337;11467.197296189186;11608.24546404481;11807.645770626896;11862.940685296518;12161.027117830728;25654.61518077193;25709.3572660685;26015;26173.21480355516;26222;33122.80144676541;34840.82579587086;35045;35134.64865351416;35673.643263567035;4990.051890140861;5099.745012749422;5418.997485465202;5491.203775452457;5507.614466987273;7279.59962202084;8120;8619.956900215459;8687.86968195465;8861.379703420957;6722.462203023844;7010.894836577558;7035.401990830836;7134.108236470442;7268.309510596485;7330.96334518324;7517.398608111229;7518.586477743776;7553.924460755322;7677.500962437423;6949.513534052568;7026.473014523829;7112.893306600508;7165.856682866209;7295.2340004298785;5192.273081768631;5245.370555533361;5294.973525132504;5311.548518375981;5460.290162278879;5558.722063896708;6646.302138275411;6927.376536111774;7059.152901651834;7152.535085219444 13:12:13 INFO - PROCESS | 3672 | |3;mootools.html;960.7886265021692;993.0119531066586;1001.4892404873515;1082.1829518713373;1129.356266927851;4515.571020753027;4838.250071238964;4861.173600487917;5270.183121616155;5430.972845135769;5415.593830462712;5432.619716619838;5435.42927992561;5476.2333273341665;5481.040817856879;1523.7561990081617;1560.15751494193;1569.1134509002377;1569.4663814303135;1571.316477332364;1496.85779850914;1523.0480949406622;1527.0074451606433;1532.5249172756426;1543.506078055023;1526.2063726862025;1541.681862007984;1543.567801015712;1552.3247387386466;1568.905865648059;1503.72932872083;1507.5402002389267;1514.2428785607196;1516.7497362935103;1518.1877695432945;1487.7396455620224;1492.1867582167745;1496.2219645784132;1498.5279636914447;1509.222750283605;5338.172583249602;5363.731813409314;5372.516473517402;5467.043267428184;5547.639403438804;3074.0777766670135;3101.4882544380152;3183.2201110727788;3209.0212485192005;3262.9347413051605;2029.52306208041;2065.6281869263526;2090.8954552272326;2114.0486780948636;2115.0165173194387;659.8581305019396;661.3188415931598;661.4212564006494;670.7015378156722;672.9730810767563;6861.176658800976;6878.312168783132;6935.063766391523;6936.7572134975535;7043.859122817515;2636.3672718547796;2649.7615214630778;2717.6467059282168;2737.835729856175;2751.2434080627986;5319.760610772524;5693.601447898607;5702.714864256771;5744.310682718101;5841.153032810304;3174.746020318369;3175.9206019849225;3176.792818728868;3185.0763278649397;3190.489521676521;2553.7829284510653;2943.67619561848;3016.140399986037;3024.6975302469577;3027.3339865229614;2115.6403411420097;2280.452691354063;2376.7742064503846;2389.2473870730664;2419.479811840463;753.5102183580716;755.8828381600861;761.0334874709199;761.4137114421865;762.2948772385632;612.4426771637789;630.4735545819201;634.8412896775806;637.996810015947;648.0214875537972;3288.8684452622106;3316.9170770730925;3396.575428071491;3419.965800341965;3470.6529347065093;658.5719282466436;665.6937808608094;666.6666666666666;672.1564436631995;702.1679310017646;2222.1444743773764;2295.9668149332865;2418.1536462238078;2428.781409673138;2469.444375015643;6315.400036996478;6419.903701444482;6474.482041436674;6522.34776522344;6529.444997175293;6460.515461340418;6466.191726034246;6466.579672321378;6473.676316184172;6482.12491313676;4989.17678583037;5216.921746173811;5225.843224703265;5244.842654720364;5311.601629877775;3481.4255647817827;3503.614602393786;3557.6264492227942;3584.1756396028536;3651.8904432867057;5985.491233245223;6018.675891304081;6055.485283750931;6090.725917333642;6091.8781624366375;5360.892782144413;5795.884082318415;5921.585489015728;6130.570860039755;6140.600860944024;4455.2426087564545;4521.886952826206;4545.636349092131;4589.655775816894;4590.931136032896;4333.220020396359;4489.079738653503;4995.150824359795;5239.790408383775;5263.421023687315;4830.734309612864;4856.028794241237;4873.87815304606;4926.8768280793265;4978.701277923336;4739.170645137018;4742.170120228877;4771.904561908673;4831.154547954165;4833.927491087707;4446.155230506193;4454.376387305844;4465.732056076646;4505.5944964952005;4533.274676051816;3034.5296479045783;3054.389122175618;3104.130843363862;3108.6580476148056;3167.366526694624;3010.3377257003426;3065.4022465619882;3072.1551573317515;3072.2165847708693;3086.6522609677786 13:12:13 INFO - PROCESS | 3672 | |4;prototype.html;211.46182964355714;214.9623815832229;220.8895552223888;222.52046839061816;223.27324558561878;4021.3766866135725;4034.0923292259263;4052.93920591191;4056.6146216109496;4075.5313138989027;3740.4389341598776;3846.788426636534;3916.7454115482547;3935.3703407454814;3944.822482988265;3013.352129292202;3030.530267808493;3034.1049390429876;3041.787074904752;3080.4301204277167;3029.727324540791;3038.4226996870634;3042.3458956324384;3046.7714921380875;3062.9846850765716;2890.9421811563757;2987.7759168062375;3030.1213247786295;3043.46739320618;3048.4665183592892;2919.095080525044;2970.910872673823;3004.1610677909384;3023.1232942446663;3040.543918412234;2610.556205445079;2627.632131501591;2639.2741995951073;2653.721359257289;2657.707652158261;3869.496965394509;3911.4915061042166;3918.373060310365;3927.410888366739;3952.26883026641;3315.602127744686;3425.383430982422;3429.1255729788995;3452.0668425681447;3464.1813048149925;4064.4148781975055;4066.979665101685;4080.8367665293354;4110.198511290299;4110.321796903508;2803.6215110959965;2805.9579106313217;2829.6180015697823;2830.2782790388524;2832.8017038807293;4332.090261045153;4340.934885976713;4353.586409291112;4372.1692878353015;4400.075984043355;2918.97081029187;2923.166897434221;2929.1505463415797;2944.41001858998;2952.896648617288;2842.7725781937397;2870.4402641485126;2914.854257287127;2919.9708002920124;2946.808457450259;3384.9845046485957;3390.779599326085;3412.1744866496306;3417.8461969211444;3427.497926513659;4047.3119569672635;4075.062735570776;4086.3835505577777;4112.650424713933;4122.103832237144;973.3332667123043;986.5757724178673;986.5954958466995;991.0733464210986;1008.253892119826;608.8234412020553;644.3942693867749;677.1400321591551;684.9006894000343;688.435482904024;3818.713596480275;3868.2070175614494;3868.7485313454536;3907.94832712828;3946.2699400610977;4247.577061684308;4253.8723838284905;4254.574542545721;4276.35854621803;4276.3799249109325;3928.2929072766606;3930.9017274568364;3934.744241624285;3941.3693808990997;3960.5049368828895;2073.968890466644;2126.787321267861;2144.4960434297927;2149.505613708856;2165.4261620670536;4065.678654437261;4077.938830917539;4087.181204364089;4103.4870641169855;4145.958540414557;4152.231837110145;4158.988418955152;4160.667146628262;4172.77049762266;4180.853670121531;4106.609872062149;4123.175624697092;4125.8968525787095;4153.231652144363;4157.355609880473;3962.6631736301583;4021.6782657387926;4050.675945924378;4070.572589878139;4088.529819070845;3945.7768091891608;3952.6245006724316;3976.0299625468165;4005.5193376794973;4006.579309172495;4069.9650174912545;4084.693647976473;4115.32097203958;4136.338185890363;4137.648299894422;2676.279970840494;2701.8243814152015;2712.701602823727;2713.3216695826045;2723.5233834079354;3911.18130069519;4014.337634290426;4017.5178978522763;4022.2960981827478;4088.632023117934;3886.9787710391006;3897.2010737798114;3904.2581909437117;3923.2349691809823;3929.980350098231;3814.653987797429;3910.1984093260244;3926.1951299982866;3968.8015599219348;3999.5200575931076;3732.6080761519647;3854.421836724514;3861.8455261789213;3879.204763023517;3883.708721845929;3911.8630847920185;3917.7845218513257;3929.9214015718953;3949.545802232665;3975.264576053439;3845.3270677630744;3961.544422391462;3981.462502562117;3996.960030399659;4004 13:12:13 INFO - PROCESS | 3672 | |5;yui.html;465.41398524369737;512.3083836820293;512.5156726893085;548.6570893191753;610.3377835048972;9724.124828765409;10560;10572.365658060513;10581.36511809292;10611.575536978511;9554.665586704466;9992.300538962276;10597.894021059787;10671.733206669836;11007.449627518632;492.8817083899856;587.6386022596105;605.9939400606004;606.8725567630803;607.6627471753176;495.00750994256464;589.7552515705977;595.952323814096;612.5161122713051;617.533762009682;644.4618743349309;647.7894684227622;648.2480322825523;650.8535579494624;654.9508786840983;509.63815690859536;525.0365579162242;641.5092454272485;641.7593402474072;642.2838535033427;453.7118929479771;461.7552697070558;470.5694289724898;474.6795912758874;478;10156.746081347952;10240.436775977318;10248.487575621264;10314;10383.117435018032;8678;8847.230553889183;8983.146601072887;9265.953670231605;9405.76485587859;8422.241998220128;8462.78843028923;8509.106543812934;8512.744617661418;8618.65525378984;3103.3172702005522;3132.8120312781307;3186.6592906019882;3213.839308034589;3279.245773472091;37125.25749484995;37659.246815063816;38341.808290958645;38481.23037539233;39034.02414939621;6914.377706006484;7027.8594428111155;7169.022496515985;7175.748848790267;7226.5664060155505;11214.66356009321;11238.66284011481;11240.887591124148;11267;11779.705507362385;4953.885375790491;4962.181240095416;5023.547880690755;5038.823641172541;5115.693058416433;2760.930976725598;2818.9013384531445;2845.252881127804;2884.1555750378725;2923.4299311634454;1852.944411667652;1912.1968773115325;1921;1927.5855691026497;1927.8554108441642;332.4083132024999;358.34601851620374;374.6010498818749;382.36336499728196;384.626911895461;442.18858394845176;444.4799584486159;464.8814552289145;469.1414711078718;483.12795404294883;5355.143177091724;5393.811216607478;5808.941910580925;5879.735411906475;5954.434328738763;345.4766029465362;375.5118346150049;490.9239067944474;501.11803226321933;509.4472497340353;2763.322985868435;2798.3284011837013;2879.640044994376;2988.6114805075636;3043.5130379139673;52767.47232527703;53352.733236333566;53826;54766;54812.451875480736;38389.80805096013;46461;48344.27483587749;48589.271160932614;48672.26991595129;32992.505112423336;40419.59580404217;42653.933651658335;42833.57166428358;43052.35421468743;5678.801241956512;5682.550949507849;5726.026575482095;5729.914051289151;5854.2389489366105;21663.241786537397;29753.702462975958;30115.397692045597;30547.389052219274;30857.228569285948;37013.62986370102;38991.805040974614;39375;39722.40416393698;39752.819774417396;7245.5313738689465;7340.412766978522;7470.8505829882015;7536.585487798224;7685.308322251024;8121.512709237465;8252.33981281484;8359.95820020896;8458.74623761288;8773.254273386834;7132.786016419515;7358.852822943618;8196.754097377088;8351;9203.861942071007;9078.818423631623;9125.634974600942;9402.482863442576;9452.432854028506;9487.857682134912;8714.869276960977;8836.381453298207;8976.4165329256;9047.140521650434;9194.218491428304;7914.881276780968;7916.267560664186;8118.228768267005;8267;8347.707830226156;7868.6065696713795;7896.960515197387;8042.195780422145;8073.555954422563;8174.346052315919 13:12:13 INFO - PROCESS | 3672 | __end_tp_report 13:12:13 INFO - PROCESS | 3672 | __start_cc_report 13:12:13 INFO - PROCESS | 3672 | _x_x_mozilla_cycle_collect,1061 13:12:13 INFO - PROCESS | 3672 | __end_cc_report 13:12:13 INFO - PROCESS | 3672 | __startTimestamp1479849133775__endTimestamp 13:12:13 INFO - PROCESS | 3672 | 13:12:13 INFO - PROCESS | 3672 | ------- Summary: start ------- 13:12:13 INFO - PROCESS | 3672 | Number of tests: 6 13:12:13 INFO - PROCESS | 3672 | 13:12:13 INFO - PROCESS | 3672 | [#0] dojo.html Cycles:165 Average:4050.61 Median:4130.34 stddev:475.78 (11.5%) stddev-sans-first:457.32 13:12:13 INFO - PROCESS | 3672 | Values: 2313.7 2585.7 2628.1 2644.3 2667.5 4431.4 4432.4 4435.8 4439.8 4467.8 4176.9 4327.3 4406.1 4418.4 4475.1 3980.6 3999.1 4010.6 4013.7 4045.5 4013.5 4050.7 4059.7 4061.4 4066.6 3996.7 4027.2 4031.5 4032.1 4053.3 4000.8 4051.1 4080.7 4081.5 4122.8 3916.4 3931.5 4031.2 4043.5 4104.6 4300.3 4319.8 4327.3 4340.0 4345.3 4534.9 4541.8 4587.8 4609.9 4621.6 4454.4 4515.4 4562.2 4612.5 4672.4 4079.0 4176.3 4184.8 4245.9 4247.3 4615.1 4654.5 4677.4 4691.7 4748.5 4398.8 4406.5 4423.8 4430.5 4447.5 4282.2 4302.1 4470.6 4476.0 4480.9 4271.2 4290.4 4304.0 4315.7 4319.6 4200.0 4204.9 4215.7 4266.1 4293.7 2854.5 2930.6 2933.4 2951.9 2955.6 2614.4 2715.6 2757.2 2762.9 2767.1 4107.2 4119.5 4119.9 4161.2 4182.5 4152.0 4160.3 4170.8 4180.8 4353.3 3911.6 3928.3 3931.2 3951.2 3993.5 3513.3 3531.4 3544.5 3551.5 3562.2 4254.7 4255.2 4257.7 4286.8 4294.0 3979.4 4219.6 4220.3 4231.4 4311.9 4103.0 4119.2 4130.3 4136.6 4195.9 4066.2 4102.7 4130.8 4150.6 4192.5 4144.5 4178.3 4221.0 4221.8 4368.6 4026.5 4051.8 4072.6 4103.3 4201.0 3941.7 3951.9 3976.1 3978.6 4032.5 3900.5 3966.8 3968.3 4029.9 4052.7 4012.6 4057.1 4063.6 4068.4 4173.7 3832.3 3868.0 3895.7 3919.6 3939.8 13:12:13 INFO - PROCESS | 3672 | 13:12:13 INFO - PROCESS | 3672 | [#1] ext.html Cycles:180 Average:34762.98 Median:29644.43 stddev:59594.65 (201.0%) stddev-sans-first:59706.21 13:12:13 INFO - PROCESS | 3672 | Values: 473.4 478.3 486.7 489.9 491.0 22754.1 29654.9 30721.0 30850.1 31277.7 29877.7 30264.4 30297.2 30853.4 30975.7 6033.1 6571.8 6676.1 6677.9 6726.5 5972.5 7707.5 7886.7 8008.4 8070.8 8016.6 8050.0 8111.3 8122.0 8172.6 6136.4 6292.3 7907.8 7943.2 7983.0 7767.3 8122.1 8126.7 8133.3 8308.0 27968.7 28170.4 28359.7 28533.9 28552.1 2466.5 2697.2 2775.9 2859.4 3002.1 21859.3 21905.3 21925.7 22010.9 22312.9 2837.4 3054.0 3065.2 3122.5 3209.7 180538.0 180630.0 180877.0 181713.0 181914.0 40457.6 41130.6 41274.8 41295.8 41348.7 24952.8 25675.6 25718.0 26971.2 27009.5 11258.4 11332.2 11360.7 11368.1 11404.9 7719.8 7979.3 8279.9 8448.7 8638.7 13289.3 13755.4 13785.9 13815.3 13872.4 5604.8 5660.0 5673.2 5688.9 5764.4 689.6 717.6 734.4 761.2 840.1 21637.7 22219.6 22343.2 22564.3 22655.7 803.1 803.2 814.8 851.5 898.7 11676.5 12287.3 12452.8 13131.8 13434.5 250703.0 261259.0 262698.0 263020.0 264940.0 38979.0 39287.6 39581.8 40237.0 40843.8 929.0 939.3 953.1 1006.7 1016.0 20973.0 22995.9 23501.5 24344.6 24654.8 35497.0 35600.0 36844.4 37666.8 38098.8 223643.0 235819.0 236316.0 237173.0 238681.0 16657.2 17624.9 18867.6 19166.6 19429.4 31645.5 31732.0 31991.8 32021.5 32320.5 26380.9 26704.2 27216.7 27295.5 27850.7 26071.3 26169.2 29634.0 30154.8 30191.8 27938.9 28289.3 28731.6 28830.0 29194.0 22575.3 24208.6 24961.1 25823.4 26091.5 18445.8 18978.9 18995.7 20104.6 20157.2 13:12:13 INFO - PROCESS | 3672 | 13:12:13 INFO - PROCESS | 3672 | [#2] jquery.html Cycles:180 Average:16253.24 Median:48756.76 stddev:40659.87 (83.4%) stddev-sans-first:40756.19 13:12:13 INFO - PROCESS | 3672 | Values: 257.3 283.3 283.7 290.2 292.3 10133.0 10974.0 10995.3 11193.9 11229.2 9958.2 10861.8 11913.8 12229.9 12314.0 3965.6 4227.5 4231.3 4248.0 4280.3 3953.3 4052.3 4130.4 4131.8 4142.1 4123.2 4142.2 4146.6 4156.7 4177.4 4123.6 4136.1 4138.6 4140.0 4146.2 3367.0 3589.7 3635.2 3646.8 3657.9 8189.3 8242.4 8323.6 8392.6 8547.0 1470.9 1493.3 1516.0 1575.1 1875.5 6004.3 6269.7 6287.8 6556.3 6568.0 1277.3 1310.1 1322.6 1343.1 1380.1 47723.5 48298.0 48457.0 48569.0 48944.5 7467.7 7529.2 7614.0 7641.2 7739.3 9881.7 9932.4 9939.4 9939.6 10123.4 4526.7 4828.6 5090.3 5333.8 5442.5 5221.5 5385.3 5407.6 5412.7 5464.5 2949.3 2959.7 2999.2 3171.7 3247.8 1285.1 1326.9 1329.4 1336.5 1345.9 640.6 674.9 711.2 727.9 734.5 12951.4 13093.9 13295.4 13473.0 13511.7 637.1 679.8 705.0 713.4 748.5 6897.3 7327.0 7390.3 7461.2 7593.0 233151.0 246285.0 246435.0 246856.0 250182.0 55740.7 55804.4 56355.0 57982.7 59015.7 640.6 675.7 676.6 678.5 684.7 11467.2 11608.2 11807.6 11862.9 12161.0 25654.6 25709.4 26015.0 26173.2 26222.0 33122.8 34840.8 35045.0 35134.6 35673.6 4990.1 5099.7 5419.0 5491.2 5507.6 7279.6 8120.0 8620.0 8687.9 8861.4 6722.5 7010.9 7035.4 7134.1 7268.3 7331.0 7517.4 7518.6 7553.9 7677.5 6949.5 7026.5 7112.9 7165.9 7295.2 5192.3 5245.4 5295.0 5311.5 5460.3 5558.7 6646.3 6927.4 7059.2 7152.5 13:12:13 INFO - PROCESS | 3672 | 13:12:13 INFO - PROCESS | 3672 | [#3] mootools.html Cycles:180 Average:3479.38 Median:4518.73 stddev:1906.87 (42.2%) stddev-sans-first:1902.82 13:12:13 INFO - PROCESS | 3672 | Values: 960.8 993.0 1001.5 1082.2 1129.4 4515.6 4838.3 4861.2 5270.2 5431.0 5415.6 5432.6 5435.4 5476.2 5481.0 1523.8 1560.2 1569.1 1569.5 1571.3 1496.9 1523.0 1527.0 1532.5 1543.5 1526.2 1541.7 1543.6 1552.3 1568.9 1503.7 1507.5 1514.2 1516.7 1518.2 1487.7 1492.2 1496.2 1498.5 1509.2 5338.2 5363.7 5372.5 5467.0 5547.6 3074.1 3101.5 3183.2 3209.0 3262.9 2029.5 2065.6 2090.9 2114.0 2115.0 659.9 661.3 661.4 670.7 673.0 6861.2 6878.3 6935.1 6936.8 7043.9 2636.4 2649.8 2717.6 2737.8 2751.2 5319.8 5693.6 5702.7 5744.3 5841.2 3174.7 3175.9 3176.8 3185.1 3190.5 2553.8 2943.7 3016.1 3024.7 3027.3 2115.6 2280.5 2376.8 2389.2 2419.5 753.5 755.9 761.0 761.4 762.3 612.4 630.5 634.8 638.0 648.0 3288.9 3316.9 3396.6 3420.0 3470.7 658.6 665.7 666.7 672.2 702.2 2222.1 2296.0 2418.2 2428.8 2469.4 6315.4 6419.9 6474.5 6522.3 6529.4 6460.5 6466.2 6466.6 6473.7 6482.1 4989.2 5216.9 5225.8 5244.8 5311.6 3481.4 3503.6 3557.6 3584.2 3651.9 5985.5 6018.7 6055.5 6090.7 6091.9 5360.9 5795.9 5921.6 6130.6 6140.6 4455.2 4521.9 4545.6 4589.7 4590.9 4333.2 4489.1 4995.2 5239.8 5263.4 4830.7 4856.0 4873.9 4926.9 4978.7 4739.2 4742.2 4771.9 4831.2 4833.9 4446.2 4454.4 4465.7 4505.6 4533.3 3034.5 3054.4 3104.1 3108.7 3167.4 3010.3 3065.4 3072.2 3072.2 3086.7 13:12:13 INFO - PROCESS | 3672 | 13:12:13 INFO - PROCESS | 3672 | [#4] prototype.html Cycles:180 Average:3373.75 Median:3924.72 stddev:1004.35 (25.6%) stddev-sans-first:978.72 13:12:13 INFO - PROCESS | 3672 | Values: 211.5 215.0 220.9 222.5 223.3 4021.4 4034.1 4052.9 4056.6 4075.5 3740.4 3846.8 3916.7 3935.4 3944.8 3013.4 3030.5 3034.1 3041.8 3080.4 3029.7 3038.4 3042.3 3046.8 3063.0 2890.9 2987.8 3030.1 3043.5 3048.5 2919.1 2970.9 3004.2 3023.1 3040.5 2610.6 2627.6 2639.3 2653.7 2657.7 3869.5 3911.5 3918.4 3927.4 3952.3 3315.6 3425.4 3429.1 3452.1 3464.2 4064.4 4067.0 4080.8 4110.2 4110.3 2803.6 2806.0 2829.6 2830.3 2832.8 4332.1 4340.9 4353.6 4372.2 4400.1 2919.0 2923.2 2929.2 2944.4 2952.9 2842.8 2870.4 2914.9 2920.0 2946.8 3385.0 3390.8 3412.2 3417.8 3427.5 4047.3 4075.1 4086.4 4112.7 4122.1 973.3 986.6 986.6 991.1 1008.3 608.8 644.4 677.1 684.9 688.4 3818.7 3868.2 3868.7 3907.9 3946.3 4247.6 4253.9 4254.6 4276.4 4276.4 3928.3 3930.9 3934.7 3941.4 3960.5 2074.0 2126.8 2144.5 2149.5 2165.4 4065.7 4077.9 4087.2 4103.5 4146.0 4152.2 4159.0 4160.7 4172.8 4180.9 4106.6 4123.2 4125.9 4153.2 4157.4 3962.7 4021.7 4050.7 4070.6 4088.5 3945.8 3952.6 3976.0 4005.5 4006.6 4070.0 4084.7 4115.3 4136.3 4137.6 2676.3 2701.8 2712.7 2713.3 2723.5 3911.2 4014.3 4017.5 4022.3 4088.6 3887.0 3897.2 3904.3 3923.2 3930.0 3814.7 3910.2 3926.2 3968.8 3999.5 3732.6 3854.4 3861.8 3879.2 3883.7 3911.9 3917.8 3929.9 3949.5 3975.3 3845.3 3961.5 3981.5 3997.0 4004.0 13:12:13 INFO - PROCESS | 3672 | 13:12:13 INFO - PROCESS | 3672 | [#5] yui.html Cycles:180 Average:11203.63 Median:2814.00 stddev:14224.22 (505.5%) stddev-sans-first:14241.26 13:12:13 INFO - PROCESS | 3672 | Values: 465.4 512.3 512.5 548.7 610.3 9724.1 10560.0 10572.4 10581.4 10611.6 9554.7 9992.3 10597.9 10671.7 11007.4 492.9 587.6 606.0 606.9 607.7 495.0 589.8 596.0 612.5 617.5 644.5 647.8 648.2 650.9 655.0 509.6 525.0 641.5 641.8 642.3 453.7 461.8 470.6 474.7 478.0 10156.7 10240.4 10248.5 10314.0 10383.1 8678.0 8847.2 8983.1 9266.0 9405.8 8422.2 8462.8 8509.1 8512.7 8618.7 3103.3 3132.8 3186.7 3213.8 3279.2 37125.3 37659.2 38341.8 38481.2 39034.0 6914.4 7027.9 7169.0 7175.7 7226.6 11214.7 11238.7 11240.9 11267.0 11779.7 4953.9 4962.2 5023.5 5038.8 5115.7 2760.9 2818.9 2845.3 2884.2 2923.4 1852.9 1912.2 1921.0 1927.6 1927.9 332.4 358.3 374.6 382.4 384.6 442.2 444.5 464.9 469.1 483.1 5355.1 5393.8 5808.9 5879.7 5954.4 345.5 375.5 490.9 501.1 509.4 2763.3 2798.3 2879.6 2988.6 3043.5 52767.5 53352.7 53826.0 54766.0 54812.5 38389.8 46461.0 48344.3 48589.3 48672.3 32992.5 40419.6 42653.9 42833.6 43052.4 5678.8 5682.6 5726.0 5729.9 5854.2 21663.2 29753.7 30115.4 30547.4 30857.2 37013.6 38991.8 39375.0 39722.4 39752.8 7245.5 7340.4 7470.9 7536.6 7685.3 8121.5 8252.3 8360.0 8458.7 8773.3 7132.8 7358.9 8196.8 8351.0 9203.9 9078.8 9125.6 9402.5 9452.4 9487.9 8714.9 8836.4 8976.4 9047.1 9194.2 7914.9 7916.3 8118.2 8267.0 8347.7 7868.6 7897.0 8042.2 8073.6 8174.3 13:12:13 INFO - PROCESS | 3672 | -------- Summary: end -------- 13:12:13 INFO - PROCESS | 3672 | 13:12:14 INFO - TEST-INFO | 3672: exit 0 13:12:15 INFO - TEST-OK | dromaeo_css | took 1125211ms 13:12:15 INFO - TEST-START | kraken 13:12:15 INFO - operating with platform_type : w8_ 13:12:15 INFO - Initialising browser for kraken test... 13:12:15 INFO - TEST-INFO | started process 968 (C:\slave\test\build\application\firefox\firefox -profile c:\users\cltbld~1.t-w\appdata\local\temp\tmp14i3p2\profile http://localhost:49276/getInfo.html) 13:12:20 INFO - PROCESS | 968 | __metrics Screen width/height:1600/1200 13:12:20 INFO - PROCESS | 968 | colorDepth:24 13:12:20 INFO - PROCESS | 968 | Browser inner width/height: 1010/674 13:12:20 INFO - PROCESS | 968 | __metrics 13:12:22 INFO - PROCESS | 968 | JavaScript error: resource://gre/modules/AsyncShutdown.jsm, line 692: Error: Phase "quit-application-granted" is finished, it is too late to register completion condition "SessionStore: flushing all windows" 13:12:22 INFO - PROCESS | 968 | JavaScript error: resource://app/modules/BrowserUsageTelemetry.jsm, line 211: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 13:12:22 INFO - PROCESS | 968 | console.error: 13:12:22 INFO - PROCESS | 968 | Message: Error: Connection closed before committing the transaction. 13:12:22 INFO - PROCESS | 968 | Stack: 13:12:22 INFO - PROCESS | 968 | ConnectionData.prototype<.executeTransaction/promise resource://gre/modules/Promise-backend.js:932:23 13:12:22 INFO - PROCESS | 968 | this.PromiseWalker.walkerLoop@resource://gre/modules/Promise.jsm -> resource://gre/modules/Promise-backend.js:813:7 13:12:22 INFO - PROCESS | 968 | Promise*this.PromiseWalker.scheduleWalkerLoop@resource://gre/modules/Promise.jsm -> resource://gre/modules/Promise-backend.js:744:11 13:12:22 INFO - PROCESS | 968 | this.PromiseWalker.schedulePromise@resource://gre/modules/Promise.jsm -> resource://gre/modules/Promise-backend.js:776:7 13:12:22 INFO - PROCESS | 968 | this.PromiseWalker.completePromise@resource://gre/modules/Promise.jsm -> resource://gre/modules/Promise-backend.js:711:7 13:12:22 INFO - PROCESS | 968 | TaskImpl_run@resource://gre/modules/Task.jsm:324:15 13:12:22 INFO - PROCESS | 968 | Spinner.prototype.observe@resource://gre/modules/AsyncShutdown.jsm:550:9 13:12:22 INFO - PROCESS | 968 | nsAsyncShutdownClient.prototype.addBlocker/moduleBlocker/<@resource://gre/components/nsAsyncShutdown.js:157:15 13:12:22 INFO - PROCESS | 968 | Promise@resource://gre/modules/Promise.jsm -> resource://gre/modules/Promise-backend.js:386:5 13:12:22 INFO - PROCESS | 968 | nsAsyncShutdownClient.prototype.addBlocker/moduleBlocker@resource://gre/components/nsAsyncShutdown.js:153:29 13:12:22 INFO - PROCESS | 968 | Barrier/this.client.addBlocker/promise13.5% 13:13:26 INFO - TinderboxPrint: I/O read bytes / time
349,939,200 / 3,132,350 13:13:26 INFO - TinderboxPrint: I/O write bytes / time
428,264,448 / 3,621,320 13:13:26 INFO - TinderboxPrint: CPU idle
8,306.6 (86.5%) 13:13:26 INFO - TinderboxPrint: CPU user
1,249.1 (13.0%) 13:13:26 INFO - install - Wall time: 3s; CPU: 12.0%; Read bytes: 0; Write bytes: 37924352; Read time: 0; Write time: 70100 13:13:26 INFO - run-tests - Wall time: 1199s; CPU: 14.0%; Read bytes: 349939200; Write bytes: 330526208; Read time: 3132350; Write time: 3504360 13:13:27 INFO - Running post-run listener: _upload_blobber_files 13:13:27 INFO - Blob upload gear active. 13:13:27 INFO - Preparing to upload files from C:\slave\test\build\blobber_upload_dir. 13:13:27 INFO - Files from C:\slave\test\build\blobber_upload_dir are to be uploaded with branch at the following location(s): https://blobupload.elasticbeanstalk.com 13:13:27 INFO - Running command: ['C:\\slave\\test\\build\\venv\\Scripts\\python', 'C:\\slave\\test\\build\\venv\\Scripts\\blobberc.py', '-u', 'https://blobupload.elasticbeanstalk.com', '-a', 'C:\\slave\\test\\oauth.txt', '-b', 'Graphics', '-d', 'C:\\slave\\test\\build\\blobber_upload_dir', '--output-manifest', 'C:\\slave\\test\\build\\uploaded_files.json'] 13:13:27 INFO - Copy/paste: C:\slave\test\build\venv\Scripts\python C:\slave\test\build\venv\Scripts\blobberc.py -u https://blobupload.elasticbeanstalk.com -a C:\slave\test\oauth.txt -b Graphics -d C:\slave\test\build\blobber_upload_dir --output-manifest C:\slave\test\build\uploaded_files.json 13:13:27 INFO - (blobuploader) - INFO - Open directory for files ... 13:13:27 INFO - (blobuploader) - INFO - Uploading C:\slave\test\build\blobber_upload_dir\dromaeojs_errorsummary.log ... 13:13:27 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 13:13:27 INFO - (blobuploader) - INFO - Uploading, attempt #1. 13:13:28 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_errorsummary.log: uploaded 13:13:28 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 13:13:28 INFO - (blobuploader) - INFO - Done attempting. 13:13:28 INFO - (blobuploader) - INFO - Uploading C:\slave\test\build\blobber_upload_dir\dromaeojs_raw.log ... 13:13:28 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 13:13:28 INFO - (blobuploader) - INFO - Uploading, attempt #1. 13:13:29 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_raw.log: uploaded 13:13:29 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 13:13:29 INFO - (blobuploader) - INFO - Done attempting. 13:13:29 INFO - (blobuploader) - INFO - Uploading C:\slave\test\build\blobber_upload_dir\resource-usage.json ... 13:13:29 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 13:13:29 INFO - (blobuploader) - INFO - Uploading, attempt #1. 13:13:31 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 13:13:31 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 13:13:31 INFO - (blobuploader) - INFO - Done attempting. 13:13:31 INFO - (blobuploader) - INFO - Iteration through files over. 13:13:31 INFO - Return code: 0 13:13:31 INFO - rmtree: C:\slave\test\build\uploaded_files.json 13:13:31 INFO - Using _rmtree_windows ... 13:13:31 INFO - retry: Calling _rmtree_windows with args: ('C:\\slave\\test\\build\\uploaded_files.json',), kwargs: {}, attempt #1 13:13:31 INFO - Setting buildbot property blobber_files to {"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Graphics/sha512/b80e42c0fa8beb201128feb5bbf0c8598f340f21be6e3007ca93960fa26148bfc12c3438f0d46b66b7e64bfd5c1f75aa3802a3c6915ce56522fb285375043522", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Graphics/sha512/a9ff71f0e12fa0c006614f6e7331b7f0b64b3ee4e90977e37204a874dca04a30672637cc784baf1557b75381b389069d32b62b4b0a66998996a459381bc1bd01", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Graphics/sha512/fa06c73648e860a591ac0b37e005f026708aafe10cbc565f116728e051fa44786e1c1f5540f648e9281886b3a676b09c3c1b3726a2b2054656abce7f20a38b64"} 13:13:31 INFO - Writing buildbot properties ['blobber_files'] to C:\slave\test\properties\blobber_files 13:13:31 INFO - Writing to file C:\slave\test\properties\blobber_files 13:13:31 INFO - Contents: 13:13:31 INFO - blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Graphics/sha512/b80e42c0fa8beb201128feb5bbf0c8598f340f21be6e3007ca93960fa26148bfc12c3438f0d46b66b7e64bfd5c1f75aa3802a3c6915ce56522fb285375043522", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Graphics/sha512/a9ff71f0e12fa0c006614f6e7331b7f0b64b3ee4e90977e37204a874dca04a30672637cc784baf1557b75381b389069d32b62b4b0a66998996a459381bc1bd01", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Graphics/sha512/fa06c73648e860a591ac0b37e005f026708aafe10cbc565f116728e051fa44786e1c1f5540f648e9281886b3a676b09c3c1b3726a2b2054656abce7f20a38b64"} 13:13:31 INFO - Running post-run listener: copy_logs_to_upload_dir 13:13:31 INFO - Copying logs to upload dir... 13:13:31 INFO - mkdir: C:\slave\test\build\upload\logs 13:13:31 INFO - Copying logs to upload dir... 13:13:31 INFO - Using _rmtree_windows ... 13:13:31 INFO - Using _rmtree_windows ... 13:13:31 INFO - Using _rmtree_windows ... 13:13:31 INFO - Using _rmtree_windows ... 13:13:31 INFO - Using _rmtree_windows ... 13:13:31 INFO - Using _rmtree_windows ... 13:13:31 INFO - Using _rmtree_windows ... program finished with exit code 0 elapsedTime=1381.659000 ========= master_lag: 1.64 ========= ========= Finished 'c:/mozilla-build/python27/python -u ...' (results: 0, elapsed: 23 mins, 3 secs) (at 2016-11-22 13:13:34.339986) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-11-22 13:13:34.346289) ========= '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-370\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-370 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-370 KTS_HOME=C:\Program Files\KTS KTS_VERSION=1.19c LOCALAPPDATA=C:\Users\cltbld.T-W864-IX-370\AppData\Local LOGONSERVER=\\T-W864-IX-370 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-370 USERDOMAIN_ROAMINGPROFILE=T-W864-IX-370 USERNAME=cltbld USERPROFILE=C:\Users\cltbld.T-W864-IX-370 WINDIR=C:\windows XPCOM_DEBUG_BREAK=warn using PTY: False blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Graphics/sha512/b80e42c0fa8beb201128feb5bbf0c8598f340f21be6e3007ca93960fa26148bfc12c3438f0d46b66b7e64bfd5c1f75aa3802a3c6915ce56522fb285375043522", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Graphics/sha512/a9ff71f0e12fa0c006614f6e7331b7f0b64b3ee4e90977e37204a874dca04a30672637cc784baf1557b75381b389069d32b62b4b0a66998996a459381bc1bd01", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Graphics/sha512/fa06c73648e860a591ac0b37e005f026708aafe10cbc565f116728e051fa44786e1c1f5540f648e9281886b3a676b09c3c1b3726a2b2054656abce7f20a38b64"} build_url:https://queue.taskcluster.net/v1/task/WfBlHjtkQWqKdJi7pskhXA/artifacts/public/build/firefox-53.0a1.en-US.win64.zip program finished with exit code 0 elapsedTime=0.101000 build_url: 'https://queue.taskcluster.net/v1/task/WfBlHjtkQWqKdJi7pskhXA/artifacts/public/build/firefox-53.0a1.en-US.win64.zip' blobber_files: '{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Graphics/sha512/b80e42c0fa8beb201128feb5bbf0c8598f340f21be6e3007ca93960fa26148bfc12c3438f0d46b66b7e64bfd5c1f75aa3802a3c6915ce56522fb285375043522", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Graphics/sha512/a9ff71f0e12fa0c006614f6e7331b7f0b64b3ee4e90977e37204a874dca04a30672637cc784baf1557b75381b389069d32b62b4b0a66998996a459381bc1bd01", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Graphics/sha512/fa06c73648e860a591ac0b37e005f026708aafe10cbc565f116728e051fa44786e1c1f5540f648e9281886b3a676b09c3c1b3726a2b2054656abce7f20a38b64"}' ========= master_lag: 0.03 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-11-22 13:13:34.472583) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-11-22 13:13:34.472958) ========= '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-370\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-370 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-370 KTS_HOME=C:\Program Files\KTS KTS_VERSION=1.19c LOCALAPPDATA=C:\Users\cltbld.T-W864-IX-370\AppData\Local LOGONSERVER=\\T-W864-IX-370 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-370 USERDOMAIN_ROAMINGPROFILE=T-W864-IX-370 USERNAME=cltbld USERPROFILE=C:\Users\cltbld.T-W864-IX-370 WINDIR=C:\windows XPCOM_DEBUG_BREAK=warn using PTY: False program finished with exit code 0 elapsedTime=0.101000 ========= master_lag: 0.02 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-11-22 13:13:34.595731) ========= ========= Started reboot slave lost (results: 0, elapsed: 0 secs) (at 2016-11-22 13:13:34.596064) ========= ========= Finished reboot slave lost (results: 0, elapsed: 0 secs) (at 2016-11-22 13:13:35.278929) ========= ========= Total master_lag: 1.81 =========