builder: autoland_win8_64_test-dromaeojs-pgo slave: t-w864-ix-059 starttime: 1476471927.9 results: success (0) buildid: 20161014093007 builduid: fc61a5d90f094cc295e7bb01213f7952 revision: c5b1bfd47d15f4e2c475d18e1987b7284cea9084 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-10-14 12:05:27.898391) ========= master: http://buildbot-master112.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-10-14 12:05:27.898828) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-10-14 12:05:27.899105) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-10-14 12:05:27.993416) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2016-10-14 12:05:27.993813) ========= '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-059\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-059 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-059 KTS_HOME=C:\Program Files\KTS KTS_VERSION=1.19c LOCALAPPDATA=C:\Users\cltbld.T-W864-IX-059\AppData\Local LOGONSERVER=\\T-W864-IX-059 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-059 USERDOMAIN_ROAMINGPROFILE=T-W864-IX-059 USERNAME=cltbld USERPROFILE=C:\Users\cltbld.T-W864-IX-059 WINDIR=C:\windows XPCOM_DEBUG_BREAK=warn using PTY: False --12:05:28-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py => `archiver_client.py' Resolving hg.mozilla.org... 63.245.215.102, 63.245.215.25 Connecting to hg.mozilla.org|63.245.215.102|: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% 1.97 GB/s 12:05:29 (1.97 GB/s) - `archiver_client.py' saved [12179/12179] program finished with exit code 0 elapsedTime=1.264000 ========= master_lag: 0.05 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2016-10-14 12:05:29.306882) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 3 secs) (at 2016-10-14 12:05:29.307210) ========= '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-059\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-059 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-059 KTS_HOME=C:\Program Files\KTS KTS_VERSION=1.19c LOCALAPPDATA=C:\Users\cltbld.T-W864-IX-059\AppData\Local LOGONSERVER=\\T-W864-IX-059 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-059 USERDOMAIN_ROAMINGPROFILE=T-W864-IX-059 USERNAME=cltbld USERPROFILE=C:\Users\cltbld.T-W864-IX-059 WINDIR=C:\windows XPCOM_DEBUG_BREAK=warn using PTY: False program finished with exit code 0 elapsedTime=3.315000 ========= master_lag: 0.02 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 3 secs) (at 2016-10-14 12:05:32.639760) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2016-10-14 12:05:32.640158) ========= 'bash' '-c' u'python archiver_client.py mozharness --repo integration/autoland --rev c5b1bfd47d15f4e2c475d18e1987b7284cea9084 --destination scripts --debug' in dir C:\slave\test\. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', u'python archiver_client.py mozharness --repo integration/autoland --rev c5b1bfd47d15f4e2c475d18e1987b7284cea9084 --destination scripts --debug'] environment: ALLUSERSPROFILE=C:\ProgramData APPDATA=C:\Users\cltbld.T-W864-IX-059\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-059 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-059 KTS_HOME=C:\Program Files\KTS KTS_VERSION=1.19c LOCALAPPDATA=C:\Users\cltbld.T-W864-IX-059\AppData\Local LOGONSERVER=\\T-W864-IX-059 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-059 USERDOMAIN_ROAMINGPROFILE=T-W864-IX-059 USERNAME=cltbld USERPROFILE=C:\Users\cltbld.T-W864-IX-059 WINDIR=C:\windows XPCOM_DEBUG_BREAK=warn using PTY: False 2016-10-14 12:05:33,006 truncating revision to first 12 chars 2016-10-14 12:05:33,006 Setting DEBUG logging. 2016-10-14 12:05:33,006 attempt 1/10 2016-10-14 12:05:33,006 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/integration/autoland/c5b1bfd47d15?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-10-14 12:05:33,703 unpacking tar archive at: autoland-c5b1bfd47d15/testing/mozharness/ 2016-10-14 12:05:33,801 skipping symlink on windows: configs/single_locale/linux32.py program finished with exit code 0 elapsedTime=1.380000 ========= master_lag: 0.06 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2016-10-14 12:05:34.082500) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-10-14 12:05:34.082827) ========= script_repo_revision: c5b1bfd47d15f4e2c475d18e1987b7284cea9084 ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-10-14 12:05:34.083266) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-10-14 12:05:34.083546) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-10-14 12:05:34.102129) ========= ========= Started 'c:/mozilla-build/python27/python -u ...' (results: 0, elapsed: 22 mins, 57 secs) (at 2016-10-14 12:05:34.102606) ========= 'c:/mozilla-build/python27/python' '-u' 'scripts/scripts/talos_script.py' '--suite' 'dromaeojs' '--add-option' '--webServer,localhost' '--branch-name' 'Autoland' '--cfg' 'talos/windows_config.py' '--download-symbols' 'ondemand' '--use-talos-json' '--blob-upload-branch' 'Autoland' 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', 'Autoland', '--cfg', 'talos/windows_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Autoland'] environment: ALLUSERSPROFILE=C:\ProgramData APPDATA=C:\Users\cltbld.T-W864-IX-059\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-059 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-059 KTS_HOME=C:\Program Files\KTS KTS_VERSION=1.19c LOCALAPPDATA=C:\Users\cltbld.T-W864-IX-059\AppData\Local LOGONSERVER=\\T-W864-IX-059 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-059 USERDOMAIN_ROAMINGPROFILE=T-W864-IX-059 USERNAME=cltbld USERPROFILE=C:\Users\cltbld.T-W864-IX-059 WINDIR=C:\windows XPCOM_DEBUG_BREAK=warn using PTY: False 12:05:34 INFO - MultiFileLogger online at 20161014 12:05:34 in C:\slave\test 12:05:34 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Autoland --cfg talos/windows_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Autoland 12:05:34 INFO - Dumping config to C:\slave\test\logs\localconfig.json. 12:05:34 INFO - {'append_to_log': False, 12:05:34 INFO - 'base_work_dir': 'C:\\slave\\test', 12:05:34 INFO - 'blob_upload_branch': 'Autoland', 12:05:34 INFO - 'blob_uploader_auth_file': 'C:\\slave\\test\\oauth.txt', 12:05:34 INFO - 'branch': 'Autoland', 12:05:34 INFO - 'buildbot_json_path': 'buildprops.json', 12:05:34 INFO - 'config_files': ('talos/windows_config.py',), 12:05:34 INFO - 'default_actions': ('clobber', 12:05:34 INFO - 'read-buildbot-config', 12:05:34 INFO - 'download-and-extract', 12:05:34 INFO - 'populate-webroot', 12:05:34 INFO - 'create-virtualenv', 12:05:34 INFO - 'install', 12:05:34 INFO - 'run-tests'), 12:05:34 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 12:05:34 INFO - 'download_minidump_stackwalk': True, 12:05:34 INFO - 'download_symbols': 'ondemand', 12:05:34 INFO - 'exes': {'easy_install': ('C:\\slave\\test\\build/venv/scripts/python', 12:05:34 INFO - 'C:\\slave\\test\\build/venv/scripts/easy_install-2.7-script.py'), 12:05:34 INFO - 'hg': 'c:/mozilla-build/hg/hg', 12:05:34 INFO - 'mozinstall': ('C:\\slave\\test\\build/venv/scripts/python', 12:05:34 INFO - 'C:\\slave\\test\\build/venv/scripts/mozinstall-script.py'), 12:05:34 INFO - 'python': 'c:/mozilla-build/python27/python.exe', 12:05:34 INFO - 'tooltool.py': ('c:/mozilla-build/python27/python.exe', 12:05:34 INFO - 'C:/mozilla-build/tooltool.py'), 12:05:34 INFO - 'virtualenv': ('c:/mozilla-build/python27/python.exe', 12:05:34 INFO - 'c:/mozilla-build/buildbotve/virtualenv.py')}, 12:05:34 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 12:05:34 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 12:05:34 INFO - 'installer_path': 'installer.exe', 12:05:34 INFO - 'log_level': 'info', 12:05:34 INFO - 'log_name': 'talos', 12:05:34 INFO - 'log_to_console': True, 12:05:34 INFO - 'metro_harness_path_frmt': '%(metro_base_path)s/metro/metrotestharness.exe', 12:05:34 INFO - 'minidump_stackwalk_path': 'win32-minidump_stackwalk.exe', 12:05:34 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/win32/releng.manifest', 12:05:34 INFO - 'opt_config_files': (), 12:05:34 INFO - 'pip_index': False, 12:05:34 INFO - 'sps_profile': False, 12:05:34 INFO - 'sps_profile_interval': 0, 12:05:34 INFO - 'suite': 'dromaeojs', 12:05:34 INFO - 'system_bits': '32', 12:05:34 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 12:05:34 INFO - 'title': 'T-W864-IX-059', 12:05:34 INFO - 'use_talos_json': True, 12:05:34 INFO - 'virtualenv_modules': ('pywin32', 'talos', 'mozinstall'), 12:05:34 INFO - 'virtualenv_path': 'C:\\slave\\test\\build/venv', 12:05:34 INFO - 'virtualenv_python_dll': 'c:/mozilla-build/python27/python27.dll', 12:05:34 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 12:05:34 INFO - 'work_dir': 'build'} 12:05:34 INFO - [mozharness: 2016-10-14 19:05:34.555000Z] Running clobber step. 12:05:34 INFO - Running pre-action listener: _resource_record_pre_action 12:05:34 INFO - Running main action method: clobber 12:05:34 INFO - rmtree: C:\slave\test\build 12:05:34 INFO - Using _rmtree_windows ... 12:05:34 INFO - retry: Calling _rmtree_windows with args: ('C:\\slave\\test\\build',), kwargs: {}, attempt #1 12:06:41 INFO - Running post-action listener: _resource_record_post_action 12:06:41 INFO - [mozharness: 2016-10-14 19:06:41.789000Z] Finished clobber step (success) 12:06:41 INFO - [mozharness: 2016-10-14 19:06:41.789000Z] Running read-buildbot-config step. 12:06:41 INFO - Running pre-action listener: _resource_record_pre_action 12:06:41 INFO - Running main action method: read_buildbot_config 12:06:41 INFO - Using buildbot properties: 12:06:41 INFO - { 12:06:41 INFO - "project": "", 12:06:41 INFO - "product": "firefox", 12:06:41 INFO - "script_repo_revision": "production", 12:06:41 INFO - "builddir": "autoland_win8_64_test-dromaeojs", 12:06:41 INFO - "repository": "", 12:06:41 INFO - "buildername": "Windows 8 64-bit autoland pgo talos dromaeojs", 12:06:41 INFO - "buildid": "20161014093007", 12:06:41 INFO - "pgo_build": "True", 12:06:41 INFO - "basedir": "C:\\slave\\test", 12:06:41 INFO - "buildnumber": 74, 12:06:41 INFO - "slavename": "t-w864-ix-059", 12:06:41 INFO - "master": "http://buildbot-master112.bb.releng.scl3.mozilla.com:8201/", 12:06:41 INFO - "platform": "win8_64", 12:06:41 INFO - "scheduler": "tests-autoland-win64-pgo-talos", 12:06:41 INFO - "branch": "autoland", 12:06:41 INFO - "repo_path": "integration/autoland", 12:06:41 INFO - "revision": "c5b1bfd47d15f4e2c475d18e1987b7284cea9084", 12:06:41 INFO - "stage_platform": "win64-pgo", 12:06:41 INFO - "builduid": "fc61a5d90f094cc295e7bb01213f7952", 12:06:41 INFO - "slavebuilddir": "test" 12:06:41 INFO - } 12:06:41 INFO - Found installer url https://queue.taskcluster.net/v1/task/Tfvx-uL5Sl2RNwD0xeruXg/artifacts/public/build/firefox-52.0a1.en-US.win64.zip. 12:06:41 INFO - Running post-action listener: _resource_record_post_action 12:06:41 INFO - [mozharness: 2016-10-14 19:06:41.792000Z] Finished read-buildbot-config step (success) 12:06:41 INFO - [mozharness: 2016-10-14 19:06:41.793000Z] Running download-and-extract step. 12:06:41 INFO - Running pre-action listener: _resource_record_pre_action 12:06:41 INFO - Running main action method: download_and_extract 12:06:41 INFO - mkdir: C:\slave\test\build\tests 12:06:41 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:06:41 INFO - trying https://queue.taskcluster.net/v1/task/Tfvx-uL5Sl2RNwD0xeruXg/artifacts/public/build/firefox-52.0a1.en-US.win64.test_packages.json 12:06:41 INFO - Downloading https://queue.taskcluster.net/v1/task/Tfvx-uL5Sl2RNwD0xeruXg/artifacts/public/build/firefox-52.0a1.en-US.win64.test_packages.json to C:\slave\test\build\firefox-52.0a1.en-US.win64.test_packages.json 12:06:41 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/Tfvx-uL5Sl2RNwD0xeruXg/artifacts/public/build/firefox-52.0a1.en-US.win64.test_packages.json', 'file_name': 'C:\\slave\\test\\build\\firefox-52.0a1.en-US.win64.test_packages.json'}, attempt #1 12:06:42 INFO - Downloaded 1218 bytes. 12:06:42 INFO - Reading from file C:\slave\test\build\firefox-52.0a1.en-US.win64.test_packages.json 12:06:42 INFO - Using the following test package requirements: 12:06:42 INFO - {u'common': [u'firefox-52.0a1.en-US.win64.common.tests.zip'], 12:06:42 INFO - u'cppunittest': [u'firefox-52.0a1.en-US.win64.common.tests.zip', 12:06:42 INFO - u'firefox-52.0a1.en-US.win64.cppunittest.tests.zip'], 12:06:42 INFO - u'gtest': [u'firefox-52.0a1.en-US.win64.common.tests.zip'], 12:06:42 INFO - u'jittest': [u'firefox-52.0a1.en-US.win64.common.tests.zip', 12:06:42 INFO - u'jsshell-win64.zip'], 12:06:42 INFO - u'mochitest': [u'firefox-52.0a1.en-US.win64.common.tests.zip', 12:06:42 INFO - u'firefox-52.0a1.en-US.win64.mochitest.tests.zip'], 12:06:42 INFO - u'mozbase': [u'firefox-52.0a1.en-US.win64.common.tests.zip'], 12:06:42 INFO - u'reftest': [u'firefox-52.0a1.en-US.win64.common.tests.zip', 12:06:42 INFO - u'firefox-52.0a1.en-US.win64.reftest.tests.zip'], 12:06:42 INFO - u'talos': [u'firefox-52.0a1.en-US.win64.common.tests.zip', 12:06:42 INFO - u'firefox-52.0a1.en-US.win64.talos.tests.zip'], 12:06:42 INFO - u'web-platform': [u'firefox-52.0a1.en-US.win64.common.tests.zip', 12:06:42 INFO - u'firefox-52.0a1.en-US.win64.web-platform.tests.zip'], 12:06:42 INFO - u'xpcshell': [u'firefox-52.0a1.en-US.win64.common.tests.zip', 12:06:42 INFO - u'firefox-52.0a1.en-US.win64.xpcshell.tests.zip']} 12:06:42 INFO - Downloading packages: [u'firefox-52.0a1.en-US.win64.common.tests.zip'] for test suite category: common 12:06:42 INFO - Downloading and extracting to C:\slave\test\build\tests these dirs * from https://queue.taskcluster.net/v1/task/Tfvx-uL5Sl2RNwD0xeruXg/artifacts/public/build/firefox-52.0a1.en-US.win64.common.tests.zip 12:06:42 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/Tfvx-uL5Sl2RNwD0xeruXg/artifacts/public/build/firefox-52.0a1.en-US.win64.common.tests.zip'}, attempt #1 12:06:42 INFO - Fetch https://queue.taskcluster.net/v1/task/Tfvx-uL5Sl2RNwD0xeruXg/artifacts/public/build/firefox-52.0a1.en-US.win64.common.tests.zip into memory 12:06:43 INFO - Http code: 200 12:06:43 INFO - via: 1.1 c54d7f08e2f3dab1918454910cc8aad0.cloudfront.net (CloudFront) 12:06:43 INFO - x-amz-cf-id: K3x1tNNuVzpEK8ts8J2QowxfAEgbMGNGA1DiOBSth_BUx7jIqI4tug== 12:06:43 INFO - x-amz-version-id: bOZyujBZFm.94L0vGlYLgPylk0eVwuJf 12:06:43 INFO - Expected file size: 17558264 12:06:43 INFO - Obtained file size: 17558264 12:07:15 INFO - Downloading packages: [u'firefox-52.0a1.en-US.win64.common.tests.zip', u'firefox-52.0a1.en-US.win64.talos.tests.zip'] for test suite category: talos 12:07:15 INFO - Downloading and extracting to C:\slave\test\build\tests these dirs * from https://queue.taskcluster.net/v1/task/Tfvx-uL5Sl2RNwD0xeruXg/artifacts/public/build/firefox-52.0a1.en-US.win64.common.tests.zip 12:07:15 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/Tfvx-uL5Sl2RNwD0xeruXg/artifacts/public/build/firefox-52.0a1.en-US.win64.common.tests.zip'}, attempt #1 12:07:15 INFO - Fetch https://queue.taskcluster.net/v1/task/Tfvx-uL5Sl2RNwD0xeruXg/artifacts/public/build/firefox-52.0a1.en-US.win64.common.tests.zip into memory 12:07:16 INFO - Http code: 200 12:07:16 INFO - via: 1.1 4c2196e36fd33f377384d605b4424e95.cloudfront.net (CloudFront) 12:07:16 INFO - x-amz-cf-id: twSMG_VAeR04IqMniwiE3ZGnDTeDmJm6XtYWyAq3of1zQE0fzBSa2g== 12:07:16 INFO - x-amz-version-id: bOZyujBZFm.94L0vGlYLgPylk0eVwuJf 12:07:16 INFO - Expected file size: 17558264 12:07:16 INFO - Obtained file size: 17558264 12:07:25 INFO - Downloading and extracting to C:\slave\test\build\tests these dirs * from https://queue.taskcluster.net/v1/task/Tfvx-uL5Sl2RNwD0xeruXg/artifacts/public/build/firefox-52.0a1.en-US.win64.talos.tests.zip 12:07:25 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/Tfvx-uL5Sl2RNwD0xeruXg/artifacts/public/build/firefox-52.0a1.en-US.win64.talos.tests.zip'}, attempt #1 12:07:25 INFO - Fetch https://queue.taskcluster.net/v1/task/Tfvx-uL5Sl2RNwD0xeruXg/artifacts/public/build/firefox-52.0a1.en-US.win64.talos.tests.zip into memory 12:07:26 INFO - Http code: 200 12:07:26 INFO - via: 1.1 37af14ee951b12568cf1cc160d08abe6.cloudfront.net (CloudFront) 12:07:26 INFO - x-amz-cf-id: 7y7LKXwUCbVKRz9XE57mYJGsqhzKyzHm7cWngtgWAhcQn2dgEfw18Q== 12:07:26 INFO - x-amz-version-id: SD969uuC4n2.eRY3Uj5nI7AjIlz.32VS 12:07:26 INFO - Expected file size: 14409006 12:07:26 INFO - Obtained file size: 14409006 12:07:39 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:07:39 INFO - trying https://queue.taskcluster.net/v1/task/Tfvx-uL5Sl2RNwD0xeruXg/artifacts/public/build/firefox-52.0a1.en-US.win64.zip 12:07:39 INFO - Downloading https://queue.taskcluster.net/v1/task/Tfvx-uL5Sl2RNwD0xeruXg/artifacts/public/build/firefox-52.0a1.en-US.win64.zip to C:\slave\test\build\firefox-52.0a1.en-US.win64.zip 12:07:39 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/Tfvx-uL5Sl2RNwD0xeruXg/artifacts/public/build/firefox-52.0a1.en-US.win64.zip', 'file_name': 'C:\\slave\\test\\build\\firefox-52.0a1.en-US.win64.zip'}, attempt #1 12:07:41 INFO - Downloaded 57339257 bytes. 12:07:41 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/Tfvx-uL5Sl2RNwD0xeruXg/artifacts/public/build/firefox-52.0a1.en-US.win64.zip 12:07:41 INFO - mkdir: C:\slave\test\properties 12:07:41 INFO - Writing buildbot properties ['build_url'] to C:\slave\test\properties\build_url 12:07:41 INFO - Writing to file C:\slave\test\properties\build_url 12:07:41 INFO - Contents: 12:07:41 INFO - build_url:https://queue.taskcluster.net/v1/task/Tfvx-uL5Sl2RNwD0xeruXg/artifacts/public/build/firefox-52.0a1.en-US.win64.zip 12:07:41 INFO - Running post-action listener: _resource_record_post_action 12:07:41 INFO - Running post-action listener: set_extra_try_arguments 12:07:41 INFO - [mozharness: 2016-10-14 19:07:41.992000Z] Finished download-and-extract step (success) 12:07:41 INFO - [mozharness: 2016-10-14 19:07:41.992000Z] Running populate-webroot step. 12:07:41 INFO - Running pre-action listener: _resource_record_pre_action 12:07:41 INFO - Running main action method: populate_webroot 12:07:41 INFO - {u'extra_options': {u'android': [u'--apkPath=%(apk_path)s']}, 12:07:41 INFO - u'mobile-suites': {u'remote-tp4m_nochrome': {u'tests': [u'tp4m']}, 12:07:41 INFO - u'remote-tsvgx': {u'talos_options': [u'--noChrome', 12:07:41 INFO - u'--tppagecycles', 12:07:41 INFO - u'7'], 12:07:41 INFO - u'tests': [u'tsvgm']}}, 12:07:41 INFO - u'suites': {u'chromez': {u'talos_options': [u'--disable-e10s'], 12:07:41 INFO - u'tests': [u'tresize', u'tcanvasmark']}, 12:07:41 INFO - u'chromez-e10s': {u'tests': [u'tresize', u'tcanvasmark']}, 12:07:41 INFO - u'dromaeojs': {u'talos_options': [u'--disable-e10s'], 12:07:41 INFO - u'tests': [u'dromaeo_css', u'kraken']}, 12:07:41 INFO - u'dromaeojs-e10s': {u'tests': [u'dromaeo_css', u'kraken']}, 12:07:41 INFO - u'g1': {u'pagesets_url': u'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 12:07:41 INFO - u'talos_options': [u'--disable-e10s'], 12:07:41 INFO - u'tests': [u'tp5o_scroll', u'glterrain']}, 12:07:41 INFO - u'g1-e10s': {u'pagesets_url': u'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 12:07:41 INFO - u'tests': [u'tp5o_scroll', u'glterrain']}, 12:07:41 INFO - u'g2': {u'pagesets_url': u'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 12:07:41 INFO - u'talos_options': [u'--disable-e10s'], 12:07:41 INFO - u'tests': [u'damp', u'tps']}, 12:07:41 INFO - u'g2-e10s': {u'pagesets_url': u'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 12:07:41 INFO - u'tests': [u'damp', u'tps']}, 12:07:41 INFO - u'g3': {u'talos_options': [u'--disable-e10s'], 12:07:41 INFO - u'tests': [u'dromaeo_dom']}, 12:07:41 INFO - u'g3-e10s': {u'tests': [u'dromaeo_dom']}, 12:07:42 INFO - u'g4': {u'talos_options': [u'--disable-e10s'], 12:07:42 INFO - u'tests': [u'basic_compositor_video']}, 12:07:42 INFO - u'g4-e10s': {u'tests': [u'basic_compositor_video']}, 12:07:42 INFO - u'other': {u'talos_options': [u'--disable-e10s'], 12:07:42 INFO - u'tests': [u'a11yr', 12:07:42 INFO - u'ts_paint', 12:07:42 INFO - u'tpaint', 12:07:42 INFO - u'sessionrestore', 12:07:42 INFO - u'sessionrestore_no_auto_restore', 12:07:42 INFO - u'tabpaint']}, 12:07:42 INFO - u'other-e10s': {u'tests': [u'a11yr', 12:07:42 INFO - u'ts_paint', 12:07:42 INFO - u'tpaint', 12:07:42 INFO - u'sessionrestore', 12:07:42 INFO - u'sessionrestore_no_auto_restore', 12:07:42 INFO - u'tabpaint']}, 12:07:42 INFO - u'other-e10s_l64': {u'tests': [u'a11yr', 12:07:42 INFO - u'ts_paint', 12:07:42 INFO - u'tpaint', 12:07:42 INFO - u'sessionrestore', 12:07:42 INFO - u'sessionrestore_no_auto_restore', 12:07:42 INFO - u'tabpaint']}, 12:07:42 INFO - u'other-e10s_nol64': {u'tests': [u'a11yr', 12:07:42 INFO - u'ts_paint', 12:07:42 INFO - u'tpaint', 12:07:42 INFO - u'sessionrestore', 12:07:42 INFO - u'sessionrestore_no_auto_restore', 12:07:42 INFO - u'tabpaint']}, 12:07:42 INFO - u'other_l64': {u'talos_options': [u'--disable-e10s'], 12:07:42 INFO - u'tests': [u'a11yr', 12:07:42 INFO - u'ts_paint', 12:07:42 INFO - u'tpaint', 12:07:42 INFO - u'sessionrestore', 12:07:42 INFO - u'sessionrestore_no_auto_restore', 12:07:42 INFO - u'tabpaint']}, 12:07:42 INFO - u'other_nol64': {u'talos_options': [u'--disable-e10s'], 12:07:42 INFO - u'tests': [u'a11yr', 12:07:42 INFO - u'ts_paint', 12:07:42 INFO - u'tpaint', 12:07:42 INFO - u'sessionrestore', 12:07:42 INFO - u'sessionrestore_no_auto_restore', 12:07:42 INFO - u'tabpaint']}, 12:07:42 INFO - u'svgr': {u'talos_options': [u'--disable-e10s'], 12:07:42 INFO - u'tests': [u'tsvgx', 12:07:42 INFO - u'tsvgr_opacity', 12:07:42 INFO - u'tart', 12:07:42 INFO - u'tscrollx', 12:07:42 INFO - u'cart']}, 12:07:42 INFO - u'svgr-e10s': {u'tests': [u'tsvgx', 12:07:42 INFO - u'tsvgr_opacity', 12:07:42 INFO - u'tart', 12:07:42 INFO - u'tscrollx', 12:07:42 INFO - u'cart']}, 12:07:42 INFO - u'tp5o': {u'pagesets_url': u'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 12:07:42 INFO - u'talos_options': [u'--disable-e10s'], 12:07:42 INFO - u'tests': [u'tp5o']}, 12:07:42 INFO - u'tp5o-e10s': {u'pagesets_url': u'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 12:07:42 INFO - u'tests': [u'tp5o']}, 12:07:42 INFO - u'xperf': {u'pagesets_url': u'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 12:07:42 INFO - u'talos_options': [u'--disable-e10s', 12:07:42 INFO - u'--xperf_path', 12:07:42 INFO - u'"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 12:07:42 INFO - u'tests': [u'tp5n']}, 12:07:42 INFO - u'xperf-e10s': {u'pagesets_url': u'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 12:07:42 INFO - u'talos_options': [u'--xperf_path', 12:07:42 INFO - u'"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 12:07:42 INFO - u'tests': [u'tp5n']}}, 12:07:42 INFO - u'talos.zip': {u'path': u'', 12:07:42 INFO - u'url': u'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 12:07:42 INFO - Running post-action listener: _resource_record_post_action 12:07:42 INFO - [mozharness: 2016-10-14 19:07:42.075000Z] Finished populate-webroot step (success) 12:07:42 INFO - [mozharness: 2016-10-14 19:07:42.075000Z] Running create-virtualenv step. 12:07:42 INFO - Running pre-action listener: _resource_record_pre_action 12:07:42 INFO - Running main action method: create_virtualenv 12:07:42 INFO - Creating virtualenv C:\slave\test\build/venv 12:07:42 INFO - mkdir: C:\slave\test\build\venv\Scripts 12:07:42 INFO - Copying c:/mozilla-build/python27/python27.dll to C:\slave\test\build\venv\Scripts\python27.dll 12:07:42 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:07:42 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:07:42 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:07:53 INFO - New python executable in C:\slave\test\build/venv\Scripts\python.exe 12:07:56 INFO - Installing distribute......................................................................................................................................................................................done. 12:07:57 INFO - Return code: 0 12:07:57 INFO - Getting output from command: ['C:\\slave\\test\\build\\venv\\Scripts\\pip', '--version'] 12:07:57 INFO - Copy/paste: C:\slave\test\build\venv\Scripts\pip --version 12:07:57 INFO - Reading from file tmpfile_stdout 12:07:57 INFO - Output received: 12:07:57 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:07:57 INFO - Using _rmtree_windows ... 12:07:57 INFO - Using _rmtree_windows ... 12:07:57 INFO - Installing pip>=1.5 into virtualenv C:\slave\test\build/venv 12:07:57 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 12:07:57 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 12:07:57 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 12:07:57 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 12:07:57 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 0x0228C640>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x02333E30>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x0243E3B8>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x0237AE90>, '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 0x01CFA910>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x0281D520>, 'level': 'critical'}], 'cwd': 'C:\\slave\\test\\build', 'env': {'TMP': 'C:\\Users\\CLTBLD~1.T-W\\AppData\\Local\\Temp', 'TEST1': 'testie', 'COMPUTERNAME': 'T-W864-IX-059', 'USERDOMAIN': 'T-W864-IX-059', '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-059', 'LOCALAPPDATA': 'C:\\Users\\cltbld.T-W864-IX-059\\AppData\\Local', 'HOMEPATH': '\\Users\\cltbld.T-W864-IX-059', 'USERDOMAIN_ROAMINGPROFILE': 'T-W864-IX-059', 'MOZBUILDDIR': 'C:\\mozilla-build\\', 'PROGRAMW6432': 'C:\\Program Files', 'USERNAME': 'cltbld', 'LOGONSERVER': '\\\\T-W864-IX-059', '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-059\\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:07:57 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:07:57 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:07:57 INFO - Using env: {'ALLUSERSPROFILE': 'C:\\ProgramData', 12:07:57 INFO - 'APPDATA': 'C:\\Users\\cltbld.T-W864-IX-059\\AppData\\Roaming', 12:07:57 INFO - 'COMMONPROGRAMFILES': 'C:\\Program Files (x86)\\Common Files', 12:07:57 INFO - 'COMMONPROGRAMFILES(X86)': 'C:\\Program Files (x86)\\Common Files', 12:07:57 INFO - 'COMMONPROGRAMW6432': 'C:\\Program Files\\Common Files', 12:07:57 INFO - 'COMPUTERNAME': 'T-W864-IX-059', 12:07:57 INFO - 'COMSPEC': 'C:\\windows\\system32\\cmd.exe', 12:07:57 INFO - 'DCLOCATION': 'SCL3', 12:07:57 INFO - 'DNSSUFFIX': 'wintest.releng.scl3.mozilla.com', 12:07:57 INFO - 'FP_NO_HOST_CHECK': 'NO', 12:07:57 INFO - 'HOMEDRIVE': 'C:', 12:07:57 INFO - 'HOMEPATH': '\\Users\\cltbld.T-W864-IX-059', 12:07:57 INFO - 'KTS_HOME': 'C:\\Program Files\\KTS', 12:07:57 INFO - 'KTS_VERSION': '1.19c', 12:07:57 INFO - 'LOCALAPPDATA': 'C:\\Users\\cltbld.T-W864-IX-059\\AppData\\Local', 12:07:57 INFO - 'LOGONSERVER': '\\\\T-W864-IX-059', 12:07:57 INFO - 'MONDIR': 'C:\\Monitor_config\\', 12:07:57 INFO - 'MOZBUILDDIR': 'C:\\mozilla-build\\', 12:07:57 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 12:07:57 INFO - 'MOZ_NO_REMOTE': '1', 12:07:57 INFO - 'NO_EM_RESTART': '1', 12:07:57 INFO - 'NUMBER_OF_PROCESSORS': '8', 12:07:57 INFO - 'OS': 'Windows_NT', 12:07:57 INFO - 'OURDRIVE': 'C:', 12:07:57 INFO - 'PATH': 'C:\\Program Files (x86)\\NVIDIA Corporation\\PhysX\\Common;C:\\windows\\system32;C:\\windows;C:\\windows\\System32\\Wbem;C:\\windows\\System32\\WindowsPowerShell\\v1.0\\;C:\\mozilla-build\\python27;C:\\mozilla-build\\python27\\Scripts;C:\\mozilla-build\\msys\\bin;C:\\mozilla-build\\vim\\vim72;C:\\mozilla-build\\wget;C:\\mozilla-build\\info-zip;C:\\CoreUtils\\bin;C:\\mozilla-build\\buildbotve\\scripts;C:\\mozilla-build\\hg', 12:07:57 INFO - 'PATHEXT': '.COM;.EXE;.BAT;.CMD;.VBS;.VBE;.JS;.JSE;.WSF;.WSH;.MSC', 12:07:57 INFO - 'PROCESSOR_ARCHITECTURE': 'x86', 12:07:57 INFO - 'PROCESSOR_ARCHITEW6432': 'AMD64', 12:07:57 INFO - 'PROCESSOR_IDENTIFIER': 'Intel64 Family 6 Model 30 Stepping 5, GenuineIntel', 12:07:57 INFO - 'PROCESSOR_LEVEL': '6', 12:07:57 INFO - 'PROCESSOR_REVISION': '1e05', 12:07:57 INFO - 'PROGRAMDATA': 'C:\\ProgramData', 12:07:57 INFO - 'PROGRAMFILES': 'C:\\Program Files (x86)', 12:07:57 INFO - 'PROGRAMFILES(X86)': 'C:\\Program Files (x86)', 12:07:57 INFO - 'PROGRAMW6432': 'C:\\Program Files', 12:07:57 INFO - 'PROMPT': '$P$G', 12:07:57 INFO - 'PROPERTIES_FILE': 'C:\\slave\\test/buildprops.json', 12:07:57 INFO - 'PSMODULEPATH': 'C:\\windows\\system32\\WindowsPowerShell\\v1.0\\Modules\\', 12:07:57 INFO - 'PUBLIC': 'C:\\Users\\Public', 12:07:57 INFO - 'PWD': 'C:\\slave\\test', 12:07:57 INFO - 'RUNLOGFILE': 'C:\\slave\\\\runslave.log', 12:07:57 INFO - 'SLAVEDIR': 'C:\\slave\\', 12:07:57 INFO - 'SYSTEMDRIVE': 'C:', 12:07:57 INFO - 'SYSTEMROOT': 'C:\\windows', 12:07:57 INFO - 'TEMP': 'C:\\Users\\CLTBLD~1.T-W\\AppData\\Local\\Temp', 12:07:57 INFO - 'TEST1': 'testie', 12:07:57 INFO - 'TMP': 'C:\\Users\\CLTBLD~1.T-W\\AppData\\Local\\Temp', 12:07:57 INFO - 'USERDOMAIN': 'T-W864-IX-059', 12:07:57 INFO - 'USERDOMAIN_ROAMINGPROFILE': 'T-W864-IX-059', 12:07:57 INFO - 'USERNAME': 'cltbld', 12:07:57 INFO - 'USERPROFILE': 'C:\\Users\\cltbld.T-W864-IX-059', 12:07:57 INFO - 'WINDIR': 'C:\\windows', 12:07:57 INFO - 'XPCOM_DEBUG_BREAK': 'warn'} 12:07:58 INFO - Ignoring indexes: http://pypi.python.org/simple/ 12:07:58 INFO - Downloading/unpacking pip>=1.5 12:08:02 INFO - Running setup.py egg_info for package pip 12:08:02 INFO - warning: no files found matching 'pip\cacert.pem' 12:08:02 INFO - warning: no files found matching '*.html' under directory 'docs' 12:08:02 INFO - warning: no previously-included files matching '*.rst' found under directory 'docs\_build' 12:08:02 INFO - no previously-included directories found matching 'docs\_build\_sources' 12:08:02 INFO - Installing collected packages: pip 12:08:02 INFO - Found existing installation: pip 0.8.2 12:08:02 INFO - Uninstalling pip: 12:08:02 INFO - Successfully uninstalled pip 12:08:02 INFO - Running setup.py install for pip 12:08:02 INFO - warning: no files found matching 'pip\cacert.pem' 12:08:02 INFO - warning: no files found matching '*.html' under directory 'docs' 12:08:02 INFO - warning: no previously-included files matching '*.rst' found under directory 'docs\_build' 12:08:02 INFO - no previously-included directories found matching 'docs\_build\_sources' 12:08:02 INFO - Installing pip-script.py script to C:\slave\test\build\venv\Scripts 12:08:02 INFO - Installing pip.exe script to C:\slave\test\build\venv\Scripts 12:08:02 INFO - Installing pip2.7-script.py script to C:\slave\test\build\venv\Scripts 12:08:02 INFO - Installing pip2.7.exe script to C:\slave\test\build\venv\Scripts 12:08:02 INFO - Installing pip2-script.py script to C:\slave\test\build\venv\Scripts 12:08:02 INFO - Installing pip2.exe script to C:\slave\test\build\venv\Scripts 12:08:02 INFO - Successfully installed pip 12:08:02 INFO - Cleaning up... 12:08:02 INFO - Return code: 0 12:08:02 INFO - Installing psutil>=3.1.1 into virtualenv C:\slave\test\build/venv 12:08:02 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:08:02 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 12:08:02 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:08:02 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 12:08:02 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 0x0228C640>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x02333E30>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x0243E3B8>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x0237AE90>, '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 0x01CFA910>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x0281D520>, 'level': 'critical'}], 'cwd': 'C:\\slave\\test\\build', 'env': {'TMP': 'C:\\Users\\CLTBLD~1.T-W\\AppData\\Local\\Temp', 'TEST1': 'testie', 'COMPUTERNAME': 'T-W864-IX-059', 'USERDOMAIN': 'T-W864-IX-059', '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-059', 'LOCALAPPDATA': 'C:\\Users\\cltbld.T-W864-IX-059\\AppData\\Local', 'HOMEPATH': '\\Users\\cltbld.T-W864-IX-059', 'USERDOMAIN_ROAMINGPROFILE': 'T-W864-IX-059', 'MOZBUILDDIR': 'C:\\mozilla-build\\', 'PROGRAMW6432': 'C:\\Program Files', 'USERNAME': 'cltbld', 'LOGONSERVER': '\\\\T-W864-IX-059', '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-059\\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:08:02 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:08:02 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:08:02 INFO - Using env: {'ALLUSERSPROFILE': 'C:\\ProgramData', 12:08:02 INFO - 'APPDATA': 'C:\\Users\\cltbld.T-W864-IX-059\\AppData\\Roaming', 12:08:02 INFO - 'COMMONPROGRAMFILES': 'C:\\Program Files (x86)\\Common Files', 12:08:02 INFO - 'COMMONPROGRAMFILES(X86)': 'C:\\Program Files (x86)\\Common Files', 12:08:02 INFO - 'COMMONPROGRAMW6432': 'C:\\Program Files\\Common Files', 12:08:02 INFO - 'COMPUTERNAME': 'T-W864-IX-059', 12:08:02 INFO - 'COMSPEC': 'C:\\windows\\system32\\cmd.exe', 12:08:02 INFO - 'DCLOCATION': 'SCL3', 12:08:02 INFO - 'DNSSUFFIX': 'wintest.releng.scl3.mozilla.com', 12:08:02 INFO - 'FP_NO_HOST_CHECK': 'NO', 12:08:02 INFO - 'HOMEDRIVE': 'C:', 12:08:02 INFO - 'HOMEPATH': '\\Users\\cltbld.T-W864-IX-059', 12:08:02 INFO - 'KTS_HOME': 'C:\\Program Files\\KTS', 12:08:02 INFO - 'KTS_VERSION': '1.19c', 12:08:02 INFO - 'LOCALAPPDATA': 'C:\\Users\\cltbld.T-W864-IX-059\\AppData\\Local', 12:08:02 INFO - 'LOGONSERVER': '\\\\T-W864-IX-059', 12:08:02 INFO - 'MONDIR': 'C:\\Monitor_config\\', 12:08:02 INFO - 'MOZBUILDDIR': 'C:\\mozilla-build\\', 12:08:02 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 12:08:02 INFO - 'MOZ_NO_REMOTE': '1', 12:08:02 INFO - 'NO_EM_RESTART': '1', 12:08:02 INFO - 'NUMBER_OF_PROCESSORS': '8', 12:08:02 INFO - 'OS': 'Windows_NT', 12:08:02 INFO - 'OURDRIVE': 'C:', 12:08:02 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:08:02 INFO - 'PATHEXT': '.COM;.EXE;.BAT;.CMD;.VBS;.VBE;.JS;.JSE;.WSF;.WSH;.MSC', 12:08:02 INFO - 'PROCESSOR_ARCHITECTURE': 'x86', 12:08:02 INFO - 'PROCESSOR_ARCHITEW6432': 'AMD64', 12:08:02 INFO - 'PROCESSOR_IDENTIFIER': 'Intel64 Family 6 Model 30 Stepping 5, GenuineIntel', 12:08:02 INFO - 'PROCESSOR_LEVEL': '6', 12:08:02 INFO - 'PROCESSOR_REVISION': '1e05', 12:08:02 INFO - 'PROGRAMDATA': 'C:\\ProgramData', 12:08:02 INFO - 'PROGRAMFILES': 'C:\\Program Files (x86)', 12:08:02 INFO - 'PROGRAMFILES(X86)': 'C:\\Program Files (x86)', 12:08:02 INFO - 'PROGRAMW6432': 'C:\\Program Files', 12:08:02 INFO - 'PROMPT': '$P$G', 12:08:02 INFO - 'PROPERTIES_FILE': 'C:\\slave\\test/buildprops.json', 12:08:02 INFO - 'PSMODULEPATH': 'C:\\windows\\system32\\WindowsPowerShell\\v1.0\\Modules\\', 12:08:02 INFO - 'PUBLIC': 'C:\\Users\\Public', 12:08:02 INFO - 'PWD': 'C:\\slave\\test', 12:08:02 INFO - 'RUNLOGFILE': 'C:\\slave\\\\runslave.log', 12:08:02 INFO - 'SLAVEDIR': 'C:\\slave\\', 12:08:02 INFO - 'SYSTEMDRIVE': 'C:', 12:08:02 INFO - 'SYSTEMROOT': 'C:\\windows', 12:08:02 INFO - 'TEMP': 'C:\\Users\\CLTBLD~1.T-W\\AppData\\Local\\Temp', 12:08:02 INFO - 'TEST1': 'testie', 12:08:02 INFO - 'TMP': 'C:\\Users\\CLTBLD~1.T-W\\AppData\\Local\\Temp', 12:08:02 INFO - 'USERDOMAIN': 'T-W864-IX-059', 12:08:02 INFO - 'USERDOMAIN_ROAMINGPROFILE': 'T-W864-IX-059', 12:08:02 INFO - 'USERNAME': 'cltbld', 12:08:02 INFO - 'USERPROFILE': 'C:\\Users\\cltbld.T-W864-IX-059', 12:08:02 INFO - 'WINDIR': 'C:\\windows', 12:08:02 INFO - 'XPCOM_DEBUG_BREAK': 'warn'} 12:08:04 INFO - Ignoring indexes: https://pypi.python.org/simple/ 12:08:04 INFO - Downloading/unpacking psutil>=3.1.1 12:08:04 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:08:04 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:08:05 INFO - Installing collected packages: psutil 12:08:05 INFO - Successfully installed psutil 12:08:05 INFO - Cleaning up... 12:08:06 INFO - Return code: 0 12:08:06 INFO - Installing mozsystemmonitor==0.3 into virtualenv C:\slave\test\build/venv 12:08:06 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 12:08:06 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 12:08:06 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 12:08:06 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 12:08:06 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 0x0228C640>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x02333E30>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x0243E3B8>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x0237AE90>, '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 0x01CFA910>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x0281D520>, 'level': 'critical'}], 'cwd': 'C:\\slave\\test\\build', 'env': {'TMP': 'C:\\Users\\CLTBLD~1.T-W\\AppData\\Local\\Temp', 'TEST1': 'testie', 'COMPUTERNAME': 'T-W864-IX-059', 'USERDOMAIN': 'T-W864-IX-059', '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-059', 'LOCALAPPDATA': 'C:\\Users\\cltbld.T-W864-IX-059\\AppData\\Local', 'HOMEPATH': '\\Users\\cltbld.T-W864-IX-059', 'USERDOMAIN_ROAMINGPROFILE': 'T-W864-IX-059', 'MOZBUILDDIR': 'C:\\mozilla-build\\', 'PROGRAMW6432': 'C:\\Program Files', 'USERNAME': 'cltbld', 'LOGONSERVER': '\\\\T-W864-IX-059', '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-059\\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:08:06 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:08:06 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:08:06 INFO - Using env: {'ALLUSERSPROFILE': 'C:\\ProgramData', 12:08:06 INFO - 'APPDATA': 'C:\\Users\\cltbld.T-W864-IX-059\\AppData\\Roaming', 12:08:06 INFO - 'COMMONPROGRAMFILES': 'C:\\Program Files (x86)\\Common Files', 12:08:06 INFO - 'COMMONPROGRAMFILES(X86)': 'C:\\Program Files (x86)\\Common Files', 12:08:06 INFO - 'COMMONPROGRAMW6432': 'C:\\Program Files\\Common Files', 12:08:06 INFO - 'COMPUTERNAME': 'T-W864-IX-059', 12:08:06 INFO - 'COMSPEC': 'C:\\windows\\system32\\cmd.exe', 12:08:06 INFO - 'DCLOCATION': 'SCL3', 12:08:06 INFO - 'DNSSUFFIX': 'wintest.releng.scl3.mozilla.com', 12:08:06 INFO - 'FP_NO_HOST_CHECK': 'NO', 12:08:06 INFO - 'HOMEDRIVE': 'C:', 12:08:06 INFO - 'HOMEPATH': '\\Users\\cltbld.T-W864-IX-059', 12:08:06 INFO - 'KTS_HOME': 'C:\\Program Files\\KTS', 12:08:06 INFO - 'KTS_VERSION': '1.19c', 12:08:06 INFO - 'LOCALAPPDATA': 'C:\\Users\\cltbld.T-W864-IX-059\\AppData\\Local', 12:08:06 INFO - 'LOGONSERVER': '\\\\T-W864-IX-059', 12:08:06 INFO - 'MONDIR': 'C:\\Monitor_config\\', 12:08:06 INFO - 'MOZBUILDDIR': 'C:\\mozilla-build\\', 12:08:06 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 12:08:06 INFO - 'MOZ_NO_REMOTE': '1', 12:08:06 INFO - 'NO_EM_RESTART': '1', 12:08:06 INFO - 'NUMBER_OF_PROCESSORS': '8', 12:08:06 INFO - 'OS': 'Windows_NT', 12:08:06 INFO - 'OURDRIVE': 'C:', 12:08:06 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:08:06 INFO - 'PATHEXT': '.COM;.EXE;.BAT;.CMD;.VBS;.VBE;.JS;.JSE;.WSF;.WSH;.MSC', 12:08:06 INFO - 'PROCESSOR_ARCHITECTURE': 'x86', 12:08:06 INFO - 'PROCESSOR_ARCHITEW6432': 'AMD64', 12:08:06 INFO - 'PROCESSOR_IDENTIFIER': 'Intel64 Family 6 Model 30 Stepping 5, GenuineIntel', 12:08:06 INFO - 'PROCESSOR_LEVEL': '6', 12:08:06 INFO - 'PROCESSOR_REVISION': '1e05', 12:08:06 INFO - 'PROGRAMDATA': 'C:\\ProgramData', 12:08:06 INFO - 'PROGRAMFILES': 'C:\\Program Files (x86)', 12:08:06 INFO - 'PROGRAMFILES(X86)': 'C:\\Program Files (x86)', 12:08:06 INFO - 'PROGRAMW6432': 'C:\\Program Files', 12:08:06 INFO - 'PROMPT': '$P$G', 12:08:06 INFO - 'PROPERTIES_FILE': 'C:\\slave\\test/buildprops.json', 12:08:06 INFO - 'PSMODULEPATH': 'C:\\windows\\system32\\WindowsPowerShell\\v1.0\\Modules\\', 12:08:06 INFO - 'PUBLIC': 'C:\\Users\\Public', 12:08:06 INFO - 'PWD': 'C:\\slave\\test', 12:08:06 INFO - 'RUNLOGFILE': 'C:\\slave\\\\runslave.log', 12:08:06 INFO - 'SLAVEDIR': 'C:\\slave\\', 12:08:06 INFO - 'SYSTEMDRIVE': 'C:', 12:08:06 INFO - 'SYSTEMROOT': 'C:\\windows', 12:08:06 INFO - 'TEMP': 'C:\\Users\\CLTBLD~1.T-W\\AppData\\Local\\Temp', 12:08:06 INFO - 'TEST1': 'testie', 12:08:06 INFO - 'TMP': 'C:\\Users\\CLTBLD~1.T-W\\AppData\\Local\\Temp', 12:08:06 INFO - 'USERDOMAIN': 'T-W864-IX-059', 12:08:06 INFO - 'USERDOMAIN_ROAMINGPROFILE': 'T-W864-IX-059', 12:08:06 INFO - 'USERNAME': 'cltbld', 12:08:06 INFO - 'USERPROFILE': 'C:\\Users\\cltbld.T-W864-IX-059', 12:08:06 INFO - 'WINDIR': 'C:\\windows', 12:08:06 INFO - 'XPCOM_DEBUG_BREAK': 'warn'} 12:08:06 INFO - Ignoring indexes: https://pypi.python.org/simple/ 12:08:06 INFO - Downloading/unpacking mozsystemmonitor==0.3 12:08:06 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:08:06 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:08:07 INFO - Downloading mozsystemmonitor-0.3.tar.gz 12:08:07 INFO - Running setup.py (path:C:\slave\test\build\venv\build\mozsystemmonitor\setup.py) egg_info for package mozsystemmonitor 12:08:07 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:08:07 INFO - Installing collected packages: mozsystemmonitor 12:08:07 INFO - Running setup.py install for mozsystemmonitor 12:08:07 INFO - Successfully installed mozsystemmonitor 12:08:07 INFO - Cleaning up... 12:08:08 INFO - Return code: 0 12:08:08 INFO - Installing jsonschema==2.5.1 into virtualenv C:\slave\test\build/venv 12:08:08 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 12:08:08 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 12:08:08 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 12:08:08 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 12:08:08 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 0x0228C640>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x02333E30>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x0243E3B8>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x0237AE90>, '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 0x01CFA910>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x0281D520>, 'level': 'critical'}], 'cwd': 'C:\\slave\\test\\build', 'env': {'TMP': 'C:\\Users\\CLTBLD~1.T-W\\AppData\\Local\\Temp', 'TEST1': 'testie', 'COMPUTERNAME': 'T-W864-IX-059', 'USERDOMAIN': 'T-W864-IX-059', '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-059', 'LOCALAPPDATA': 'C:\\Users\\cltbld.T-W864-IX-059\\AppData\\Local', 'HOMEPATH': '\\Users\\cltbld.T-W864-IX-059', 'USERDOMAIN_ROAMINGPROFILE': 'T-W864-IX-059', 'MOZBUILDDIR': 'C:\\mozilla-build\\', 'PROGRAMW6432': 'C:\\Program Files', 'USERNAME': 'cltbld', 'LOGONSERVER': '\\\\T-W864-IX-059', '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-059\\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:08:08 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:08:08 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:08:08 INFO - Using env: {'ALLUSERSPROFILE': 'C:\\ProgramData', 12:08:08 INFO - 'APPDATA': 'C:\\Users\\cltbld.T-W864-IX-059\\AppData\\Roaming', 12:08:08 INFO - 'COMMONPROGRAMFILES': 'C:\\Program Files (x86)\\Common Files', 12:08:08 INFO - 'COMMONPROGRAMFILES(X86)': 'C:\\Program Files (x86)\\Common Files', 12:08:08 INFO - 'COMMONPROGRAMW6432': 'C:\\Program Files\\Common Files', 12:08:08 INFO - 'COMPUTERNAME': 'T-W864-IX-059', 12:08:08 INFO - 'COMSPEC': 'C:\\windows\\system32\\cmd.exe', 12:08:08 INFO - 'DCLOCATION': 'SCL3', 12:08:08 INFO - 'DNSSUFFIX': 'wintest.releng.scl3.mozilla.com', 12:08:08 INFO - 'FP_NO_HOST_CHECK': 'NO', 12:08:08 INFO - 'HOMEDRIVE': 'C:', 12:08:08 INFO - 'HOMEPATH': '\\Users\\cltbld.T-W864-IX-059', 12:08:08 INFO - 'KTS_HOME': 'C:\\Program Files\\KTS', 12:08:08 INFO - 'KTS_VERSION': '1.19c', 12:08:08 INFO - 'LOCALAPPDATA': 'C:\\Users\\cltbld.T-W864-IX-059\\AppData\\Local', 12:08:08 INFO - 'LOGONSERVER': '\\\\T-W864-IX-059', 12:08:08 INFO - 'MONDIR': 'C:\\Monitor_config\\', 12:08:08 INFO - 'MOZBUILDDIR': 'C:\\mozilla-build\\', 12:08:08 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 12:08:08 INFO - 'MOZ_NO_REMOTE': '1', 12:08:08 INFO - 'NO_EM_RESTART': '1', 12:08:08 INFO - 'NUMBER_OF_PROCESSORS': '8', 12:08:08 INFO - 'OS': 'Windows_NT', 12:08:08 INFO - 'OURDRIVE': 'C:', 12:08:08 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:08:08 INFO - 'PATHEXT': '.COM;.EXE;.BAT;.CMD;.VBS;.VBE;.JS;.JSE;.WSF;.WSH;.MSC', 12:08:08 INFO - 'PROCESSOR_ARCHITECTURE': 'x86', 12:08:08 INFO - 'PROCESSOR_ARCHITEW6432': 'AMD64', 12:08:08 INFO - 'PROCESSOR_IDENTIFIER': 'Intel64 Family 6 Model 30 Stepping 5, GenuineIntel', 12:08:08 INFO - 'PROCESSOR_LEVEL': '6', 12:08:08 INFO - 'PROCESSOR_REVISION': '1e05', 12:08:08 INFO - 'PROGRAMDATA': 'C:\\ProgramData', 12:08:08 INFO - 'PROGRAMFILES': 'C:\\Program Files (x86)', 12:08:08 INFO - 'PROGRAMFILES(X86)': 'C:\\Program Files (x86)', 12:08:08 INFO - 'PROGRAMW6432': 'C:\\Program Files', 12:08:08 INFO - 'PROMPT': '$P$G', 12:08:08 INFO - 'PROPERTIES_FILE': 'C:\\slave\\test/buildprops.json', 12:08:08 INFO - 'PSMODULEPATH': 'C:\\windows\\system32\\WindowsPowerShell\\v1.0\\Modules\\', 12:08:08 INFO - 'PUBLIC': 'C:\\Users\\Public', 12:08:08 INFO - 'PWD': 'C:\\slave\\test', 12:08:08 INFO - 'RUNLOGFILE': 'C:\\slave\\\\runslave.log', 12:08:08 INFO - 'SLAVEDIR': 'C:\\slave\\', 12:08:08 INFO - 'SYSTEMDRIVE': 'C:', 12:08:08 INFO - 'SYSTEMROOT': 'C:\\windows', 12:08:08 INFO - 'TEMP': 'C:\\Users\\CLTBLD~1.T-W\\AppData\\Local\\Temp', 12:08:08 INFO - 'TEST1': 'testie', 12:08:08 INFO - 'TMP': 'C:\\Users\\CLTBLD~1.T-W\\AppData\\Local\\Temp', 12:08:08 INFO - 'USERDOMAIN': 'T-W864-IX-059', 12:08:08 INFO - 'USERDOMAIN_ROAMINGPROFILE': 'T-W864-IX-059', 12:08:08 INFO - 'USERNAME': 'cltbld', 12:08:08 INFO - 'USERPROFILE': 'C:\\Users\\cltbld.T-W864-IX-059', 12:08:08 INFO - 'WINDIR': 'C:\\windows', 12:08:08 INFO - 'XPCOM_DEBUG_BREAK': 'warn'} 12:08:08 INFO - Ignoring indexes: https://pypi.python.org/simple/ 12:08:08 INFO - Downloading/unpacking jsonschema==2.5.1 12:08:08 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:08:08 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:08:09 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 12:08:09 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 12:08:09 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:08:09 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:08:09 INFO - Downloading functools32-3.2.3-2.tar.gz 12:08:09 INFO - Running setup.py (path:C:\slave\test\build\venv\build\functools32\setup.py) egg_info for package functools32 12:08:09 INFO - warning: no files found matching '*.txt' 12:08:09 INFO - no previously-included directories found matching 'build' 12:08:09 INFO - no previously-included directories found matching 'dist' 12:08:09 INFO - no previously-included directories found matching '.git*' 12:08:09 INFO - Installing collected packages: jsonschema, functools32 12:08:09 INFO - Running setup.py install for functools32 12:08:09 INFO - warning: no files found matching '*.txt' 12:08:09 INFO - no previously-included directories found matching 'build' 12:08:09 INFO - no previously-included directories found matching 'dist' 12:08:09 INFO - no previously-included directories found matching '.git*' 12:08:09 INFO - Successfully installed jsonschema functools32 12:08:09 INFO - Cleaning up... 12:08:10 INFO - Return code: 0 12:08:10 INFO - Installing functools32==3.2.3-2 into virtualenv C:\slave\test\build/venv 12:08:10 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:08:10 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 12:08:10 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:08:10 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 12:08:10 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 0x0228C640>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x02333E30>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x0243E3B8>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x0237AE90>, '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 0x01CFA910>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x0281D520>, 'level': 'critical'}], 'cwd': 'C:\\slave\\test\\build', 'env': {'TMP': 'C:\\Users\\CLTBLD~1.T-W\\AppData\\Local\\Temp', 'TEST1': 'testie', 'COMPUTERNAME': 'T-W864-IX-059', 'USERDOMAIN': 'T-W864-IX-059', '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-059', 'LOCALAPPDATA': 'C:\\Users\\cltbld.T-W864-IX-059\\AppData\\Local', 'HOMEPATH': '\\Users\\cltbld.T-W864-IX-059', 'USERDOMAIN_ROAMINGPROFILE': 'T-W864-IX-059', 'MOZBUILDDIR': 'C:\\mozilla-build\\', 'PROGRAMW6432': 'C:\\Program Files', 'USERNAME': 'cltbld', 'LOGONSERVER': '\\\\T-W864-IX-059', '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-059\\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:08:10 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:08:10 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:08:10 INFO - Using env: {'ALLUSERSPROFILE': 'C:\\ProgramData', 12:08:10 INFO - 'APPDATA': 'C:\\Users\\cltbld.T-W864-IX-059\\AppData\\Roaming', 12:08:10 INFO - 'COMMONPROGRAMFILES': 'C:\\Program Files (x86)\\Common Files', 12:08:10 INFO - 'COMMONPROGRAMFILES(X86)': 'C:\\Program Files (x86)\\Common Files', 12:08:10 INFO - 'COMMONPROGRAMW6432': 'C:\\Program Files\\Common Files', 12:08:10 INFO - 'COMPUTERNAME': 'T-W864-IX-059', 12:08:10 INFO - 'COMSPEC': 'C:\\windows\\system32\\cmd.exe', 12:08:10 INFO - 'DCLOCATION': 'SCL3', 12:08:10 INFO - 'DNSSUFFIX': 'wintest.releng.scl3.mozilla.com', 12:08:10 INFO - 'FP_NO_HOST_CHECK': 'NO', 12:08:10 INFO - 'HOMEDRIVE': 'C:', 12:08:10 INFO - 'HOMEPATH': '\\Users\\cltbld.T-W864-IX-059', 12:08:10 INFO - 'KTS_HOME': 'C:\\Program Files\\KTS', 12:08:10 INFO - 'KTS_VERSION': '1.19c', 12:08:10 INFO - 'LOCALAPPDATA': 'C:\\Users\\cltbld.T-W864-IX-059\\AppData\\Local', 12:08:10 INFO - 'LOGONSERVER': '\\\\T-W864-IX-059', 12:08:10 INFO - 'MONDIR': 'C:\\Monitor_config\\', 12:08:10 INFO - 'MOZBUILDDIR': 'C:\\mozilla-build\\', 12:08:10 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 12:08:10 INFO - 'MOZ_NO_REMOTE': '1', 12:08:10 INFO - 'NO_EM_RESTART': '1', 12:08:10 INFO - 'NUMBER_OF_PROCESSORS': '8', 12:08:10 INFO - 'OS': 'Windows_NT', 12:08:10 INFO - 'OURDRIVE': 'C:', 12:08:10 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:08:10 INFO - 'PATHEXT': '.COM;.EXE;.BAT;.CMD;.VBS;.VBE;.JS;.JSE;.WSF;.WSH;.MSC', 12:08:10 INFO - 'PROCESSOR_ARCHITECTURE': 'x86', 12:08:10 INFO - 'PROCESSOR_ARCHITEW6432': 'AMD64', 12:08:10 INFO - 'PROCESSOR_IDENTIFIER': 'Intel64 Family 6 Model 30 Stepping 5, GenuineIntel', 12:08:10 INFO - 'PROCESSOR_LEVEL': '6', 12:08:10 INFO - 'PROCESSOR_REVISION': '1e05', 12:08:10 INFO - 'PROGRAMDATA': 'C:\\ProgramData', 12:08:10 INFO - 'PROGRAMFILES': 'C:\\Program Files (x86)', 12:08:10 INFO - 'PROGRAMFILES(X86)': 'C:\\Program Files (x86)', 12:08:10 INFO - 'PROGRAMW6432': 'C:\\Program Files', 12:08:10 INFO - 'PROMPT': '$P$G', 12:08:10 INFO - 'PROPERTIES_FILE': 'C:\\slave\\test/buildprops.json', 12:08:10 INFO - 'PSMODULEPATH': 'C:\\windows\\system32\\WindowsPowerShell\\v1.0\\Modules\\', 12:08:10 INFO - 'PUBLIC': 'C:\\Users\\Public', 12:08:10 INFO - 'PWD': 'C:\\slave\\test', 12:08:10 INFO - 'RUNLOGFILE': 'C:\\slave\\\\runslave.log', 12:08:10 INFO - 'SLAVEDIR': 'C:\\slave\\', 12:08:10 INFO - 'SYSTEMDRIVE': 'C:', 12:08:10 INFO - 'SYSTEMROOT': 'C:\\windows', 12:08:10 INFO - 'TEMP': 'C:\\Users\\CLTBLD~1.T-W\\AppData\\Local\\Temp', 12:08:10 INFO - 'TEST1': 'testie', 12:08:10 INFO - 'TMP': 'C:\\Users\\CLTBLD~1.T-W\\AppData\\Local\\Temp', 12:08:10 INFO - 'USERDOMAIN': 'T-W864-IX-059', 12:08:10 INFO - 'USERDOMAIN_ROAMINGPROFILE': 'T-W864-IX-059', 12:08:10 INFO - 'USERNAME': 'cltbld', 12:08:10 INFO - 'USERPROFILE': 'C:\\Users\\cltbld.T-W864-IX-059', 12:08:10 INFO - 'WINDIR': 'C:\\windows', 12:08:10 INFO - 'XPCOM_DEBUG_BREAK': 'warn'} 12:08:10 INFO - Ignoring indexes: https://pypi.python.org/simple/ 12:08:10 INFO - Requirement already satisfied (use --upgrade to upgrade): functools32==3.2.3-2 in c:\slave\test\build\venv\lib\site-packages 12:08:10 INFO - Cleaning up... 12:08:10 INFO - Return code: 0 12:08:10 INFO - Installing blobuploader==1.2.4 into virtualenv C:\slave\test\build/venv 12:08:10 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:08:10 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 12:08:10 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:08:10 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 12:08:10 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 0x0228C640>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x02333E30>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x0243E3B8>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x0237AE90>, '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 0x01CFA910>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x0281D520>, 'level': 'critical'}], 'cwd': 'C:\\slave\\test\\build', 'env': {'TMP': 'C:\\Users\\CLTBLD~1.T-W\\AppData\\Local\\Temp', 'TEST1': 'testie', 'COMPUTERNAME': 'T-W864-IX-059', 'USERDOMAIN': 'T-W864-IX-059', '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-059', 'LOCALAPPDATA': 'C:\\Users\\cltbld.T-W864-IX-059\\AppData\\Local', 'HOMEPATH': '\\Users\\cltbld.T-W864-IX-059', 'USERDOMAIN_ROAMINGPROFILE': 'T-W864-IX-059', 'MOZBUILDDIR': 'C:\\mozilla-build\\', 'PROGRAMW6432': 'C:\\Program Files', 'USERNAME': 'cltbld', 'LOGONSERVER': '\\\\T-W864-IX-059', '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-059\\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:08:10 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:08:10 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:08:10 INFO - Using env: {'ALLUSERSPROFILE': 'C:\\ProgramData', 12:08:10 INFO - 'APPDATA': 'C:\\Users\\cltbld.T-W864-IX-059\\AppData\\Roaming', 12:08:10 INFO - 'COMMONPROGRAMFILES': 'C:\\Program Files (x86)\\Common Files', 12:08:10 INFO - 'COMMONPROGRAMFILES(X86)': 'C:\\Program Files (x86)\\Common Files', 12:08:10 INFO - 'COMMONPROGRAMW6432': 'C:\\Program Files\\Common Files', 12:08:10 INFO - 'COMPUTERNAME': 'T-W864-IX-059', 12:08:10 INFO - 'COMSPEC': 'C:\\windows\\system32\\cmd.exe', 12:08:10 INFO - 'DCLOCATION': 'SCL3', 12:08:10 INFO - 'DNSSUFFIX': 'wintest.releng.scl3.mozilla.com', 12:08:10 INFO - 'FP_NO_HOST_CHECK': 'NO', 12:08:10 INFO - 'HOMEDRIVE': 'C:', 12:08:10 INFO - 'HOMEPATH': '\\Users\\cltbld.T-W864-IX-059', 12:08:10 INFO - 'KTS_HOME': 'C:\\Program Files\\KTS', 12:08:10 INFO - 'KTS_VERSION': '1.19c', 12:08:10 INFO - 'LOCALAPPDATA': 'C:\\Users\\cltbld.T-W864-IX-059\\AppData\\Local', 12:08:10 INFO - 'LOGONSERVER': '\\\\T-W864-IX-059', 12:08:10 INFO - 'MONDIR': 'C:\\Monitor_config\\', 12:08:10 INFO - 'MOZBUILDDIR': 'C:\\mozilla-build\\', 12:08:10 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 12:08:10 INFO - 'MOZ_NO_REMOTE': '1', 12:08:10 INFO - 'NO_EM_RESTART': '1', 12:08:10 INFO - 'NUMBER_OF_PROCESSORS': '8', 12:08:10 INFO - 'OS': 'Windows_NT', 12:08:10 INFO - 'OURDRIVE': 'C:', 12:08:10 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:08:10 INFO - 'PATHEXT': '.COM;.EXE;.BAT;.CMD;.VBS;.VBE;.JS;.JSE;.WSF;.WSH;.MSC', 12:08:10 INFO - 'PROCESSOR_ARCHITECTURE': 'x86', 12:08:10 INFO - 'PROCESSOR_ARCHITEW6432': 'AMD64', 12:08:10 INFO - 'PROCESSOR_IDENTIFIER': 'Intel64 Family 6 Model 30 Stepping 5, GenuineIntel', 12:08:10 INFO - 'PROCESSOR_LEVEL': '6', 12:08:10 INFO - 'PROCESSOR_REVISION': '1e05', 12:08:10 INFO - 'PROGRAMDATA': 'C:\\ProgramData', 12:08:10 INFO - 'PROGRAMFILES': 'C:\\Program Files (x86)', 12:08:10 INFO - 'PROGRAMFILES(X86)': 'C:\\Program Files (x86)', 12:08:10 INFO - 'PROGRAMW6432': 'C:\\Program Files', 12:08:10 INFO - 'PROMPT': '$P$G', 12:08:10 INFO - 'PROPERTIES_FILE': 'C:\\slave\\test/buildprops.json', 12:08:10 INFO - 'PSMODULEPATH': 'C:\\windows\\system32\\WindowsPowerShell\\v1.0\\Modules\\', 12:08:10 INFO - 'PUBLIC': 'C:\\Users\\Public', 12:08:10 INFO - 'PWD': 'C:\\slave\\test', 12:08:10 INFO - 'RUNLOGFILE': 'C:\\slave\\\\runslave.log', 12:08:10 INFO - 'SLAVEDIR': 'C:\\slave\\', 12:08:10 INFO - 'SYSTEMDRIVE': 'C:', 12:08:10 INFO - 'SYSTEMROOT': 'C:\\windows', 12:08:10 INFO - 'TEMP': 'C:\\Users\\CLTBLD~1.T-W\\AppData\\Local\\Temp', 12:08:10 INFO - 'TEST1': 'testie', 12:08:10 INFO - 'TMP': 'C:\\Users\\CLTBLD~1.T-W\\AppData\\Local\\Temp', 12:08:10 INFO - 'USERDOMAIN': 'T-W864-IX-059', 12:08:10 INFO - 'USERDOMAIN_ROAMINGPROFILE': 'T-W864-IX-059', 12:08:10 INFO - 'USERNAME': 'cltbld', 12:08:10 INFO - 'USERPROFILE': 'C:\\Users\\cltbld.T-W864-IX-059', 12:08:10 INFO - 'WINDIR': 'C:\\windows', 12:08:10 INFO - 'XPCOM_DEBUG_BREAK': 'warn'} 12:08:11 INFO - Ignoring indexes: https://pypi.python.org/simple/ 12:08:11 INFO - Downloading/unpacking blobuploader==1.2.4 12:08:11 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:08:11 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:08:12 INFO - Downloading blobuploader-1.2.4.tar.gz 12:08:12 INFO - Running setup.py (path:C:\slave\test\build\venv\build\blobuploader\setup.py) egg_info for package blobuploader 12:08:12 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 12:08:12 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:08:12 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:08:12 INFO - Running setup.py (path:C:\slave\test\build\venv\build\requests\setup.py) egg_info for package requests 12:08:12 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 12:08:12 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:08:12 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:08:12 INFO - Downloading docopt-0.6.1.tar.gz 12:08:12 INFO - Running setup.py (path:C:\slave\test\build\venv\build\docopt\setup.py) egg_info for package docopt 12:08:12 INFO - Installing collected packages: blobuploader, requests, docopt 12:08:12 INFO - Running setup.py install for blobuploader 12:08:12 INFO - Running setup.py install for requests 12:08:13 INFO - Running setup.py install for docopt 12:08:13 INFO - Successfully installed blobuploader requests docopt 12:08:13 INFO - Cleaning up... 12:08:14 INFO - Return code: 0 12:08:14 INFO - Installing None into virtualenv C:\slave\test\build/venv 12:08:14 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:08:14 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 12:08:14 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:08:14 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 12:08:14 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 0x0228C640>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x02333E30>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x0243E3B8>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x0237AE90>, '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 0x01CFA910>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x0281D520>, '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-059', 'USERDOMAIN': 'T-W864-IX-059', '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-059', 'LOCALAPPDATA': 'C:\\Users\\cltbld.T-W864-IX-059\\AppData\\Local', 'HOMEPATH': '\\Users\\cltbld.T-W864-IX-059', 'USERDOMAIN_ROAMINGPROFILE': 'T-W864-IX-059', 'MOZBUILDDIR': 'C:\\mozilla-build\\', 'PROGRAMW6432': 'C:\\Program Files', 'USERNAME': 'cltbld', 'LOGONSERVER': '\\\\T-W864-IX-059', '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-059\\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:08:14 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:08:14 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:08:14 INFO - Using env: {'ALLUSERSPROFILE': 'C:\\ProgramData', 12:08:14 INFO - 'APPDATA': 'C:\\Users\\cltbld.T-W864-IX-059\\AppData\\Roaming', 12:08:14 INFO - 'COMMONPROGRAMFILES': 'C:\\Program Files (x86)\\Common Files', 12:08:14 INFO - 'COMMONPROGRAMFILES(X86)': 'C:\\Program Files (x86)\\Common Files', 12:08:14 INFO - 'COMMONPROGRAMW6432': 'C:\\Program Files\\Common Files', 12:08:14 INFO - 'COMPUTERNAME': 'T-W864-IX-059', 12:08:14 INFO - 'COMSPEC': 'C:\\windows\\system32\\cmd.exe', 12:08:14 INFO - 'DCLOCATION': 'SCL3', 12:08:14 INFO - 'DNSSUFFIX': 'wintest.releng.scl3.mozilla.com', 12:08:14 INFO - 'FP_NO_HOST_CHECK': 'NO', 12:08:14 INFO - 'HOMEDRIVE': 'C:', 12:08:14 INFO - 'HOMEPATH': '\\Users\\cltbld.T-W864-IX-059', 12:08:14 INFO - 'KTS_HOME': 'C:\\Program Files\\KTS', 12:08:14 INFO - 'KTS_VERSION': '1.19c', 12:08:14 INFO - 'LOCALAPPDATA': 'C:\\Users\\cltbld.T-W864-IX-059\\AppData\\Local', 12:08:14 INFO - 'LOGONSERVER': '\\\\T-W864-IX-059', 12:08:14 INFO - 'MONDIR': 'C:\\Monitor_config\\', 12:08:14 INFO - 'MOZBUILDDIR': 'C:\\mozilla-build\\', 12:08:14 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 12:08:14 INFO - 'MOZ_NO_REMOTE': '1', 12:08:14 INFO - 'NO_EM_RESTART': '1', 12:08:14 INFO - 'NUMBER_OF_PROCESSORS': '8', 12:08:14 INFO - 'OS': 'Windows_NT', 12:08:14 INFO - 'OURDRIVE': 'C:', 12:08:14 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:08:14 INFO - 'PATHEXT': '.COM;.EXE;.BAT;.CMD;.VBS;.VBE;.JS;.JSE;.WSF;.WSH;.MSC', 12:08:14 INFO - 'PROCESSOR_ARCHITECTURE': 'x86', 12:08:14 INFO - 'PROCESSOR_ARCHITEW6432': 'AMD64', 12:08:14 INFO - 'PROCESSOR_IDENTIFIER': 'Intel64 Family 6 Model 30 Stepping 5, GenuineIntel', 12:08:14 INFO - 'PROCESSOR_LEVEL': '6', 12:08:14 INFO - 'PROCESSOR_REVISION': '1e05', 12:08:14 INFO - 'PROGRAMDATA': 'C:\\ProgramData', 12:08:14 INFO - 'PROGRAMFILES': 'C:\\Program Files (x86)', 12:08:14 INFO - 'PROGRAMFILES(X86)': 'C:\\Program Files (x86)', 12:08:14 INFO - 'PROGRAMW6432': 'C:\\Program Files', 12:08:14 INFO - 'PROMPT': '$P$G', 12:08:14 INFO - 'PROPERTIES_FILE': 'C:\\slave\\test/buildprops.json', 12:08:14 INFO - 'PSMODULEPATH': 'C:\\windows\\system32\\WindowsPowerShell\\v1.0\\Modules\\', 12:08:14 INFO - 'PUBLIC': 'C:\\Users\\Public', 12:08:14 INFO - 'PWD': 'C:\\slave\\test', 12:08:14 INFO - 'RUNLOGFILE': 'C:\\slave\\\\runslave.log', 12:08:14 INFO - 'SLAVEDIR': 'C:\\slave\\', 12:08:14 INFO - 'SYSTEMDRIVE': 'C:', 12:08:14 INFO - 'SYSTEMROOT': 'C:\\windows', 12:08:14 INFO - 'TEMP': 'C:\\Users\\CLTBLD~1.T-W\\AppData\\Local\\Temp', 12:08:14 INFO - 'TEST1': 'testie', 12:08:14 INFO - 'TMP': 'C:\\Users\\CLTBLD~1.T-W\\AppData\\Local\\Temp', 12:08:14 INFO - 'USERDOMAIN': 'T-W864-IX-059', 12:08:14 INFO - 'USERDOMAIN_ROAMINGPROFILE': 'T-W864-IX-059', 12:08:14 INFO - 'USERNAME': 'cltbld', 12:08:14 INFO - 'USERPROFILE': 'C:\\Users\\cltbld.T-W864-IX-059', 12:08:14 INFO - 'WINDIR': 'C:\\windows', 12:08:14 INFO - 'XPCOM_DEBUG_BREAK': 'warn'} 12:08:15 INFO - Ignoring indexes: https://pypi.python.org/simple/ 12:08:15 INFO - Unpacking c:\slave\test\build\tests\mozbase\manifestparser 12:08:15 INFO - Running setup.py (path:c:\users\cltbld~1.t-w\appdata\local\temp\pip-dbn1wh-build\setup.py) egg_info for package from file:///C:/slave/test/build/tests/mozbase/manifestparser 12:08:15 INFO - Unpacking c:\slave\test\build\tests\mozbase\mozcrash 12:08:15 INFO - Running setup.py (path:c:\users\cltbld~1.t-w\appdata\local\temp\pip-_waafc-build\setup.py) egg_info for package from file:///C:/slave/test/build/tests/mozbase/mozcrash 12:08:15 INFO - Unpacking c:\slave\test\build\tests\mozbase\mozdebug 12:08:15 INFO - Running setup.py (path:c:\users\cltbld~1.t-w\appdata\local\temp\pip-3wu8yj-build\setup.py) egg_info for package from file:///C:/slave/test/build/tests/mozbase/mozdebug 12:08:15 INFO - Unpacking c:\slave\test\build\tests\mozbase\mozdevice 12:08:15 INFO - Running setup.py (path:c:\users\cltbld~1.t-w\appdata\local\temp\pip-y6uljv-build\setup.py) egg_info for package from file:///C:/slave/test/build/tests/mozbase/mozdevice 12:08:15 INFO - Unpacking c:\slave\test\build\tests\mozbase\mozfile 12:08:15 INFO - Running setup.py (path:c:\users\cltbld~1.t-w\appdata\local\temp\pip-r9jhua-build\setup.py) egg_info for package from file:///C:/slave/test/build/tests/mozbase/mozfile 12:08:15 INFO - Unpacking c:\slave\test\build\tests\mozbase\mozhttpd 12:08:15 INFO - Running setup.py (path:c:\users\cltbld~1.t-w\appdata\local\temp\pip-wn6kvw-build\setup.py) egg_info for package from file:///C:/slave/test/build/tests/mozbase/mozhttpd 12:08:15 INFO - Unpacking c:\slave\test\build\tests\mozbase\mozinfo 12:08:15 INFO - Running setup.py (path:c:\users\cltbld~1.t-w\appdata\local\temp\pip-nhhvlc-build\setup.py) egg_info for package from file:///C:/slave/test/build/tests/mozbase/mozinfo 12:08:16 INFO - Unpacking c:\slave\test\build\tests\mozbase\mozinstall 12:08:16 INFO - Running setup.py (path:c:\users\cltbld~1.t-w\appdata\local\temp\pip-wmpmdo-build\setup.py) egg_info for package from file:///C:/slave/test/build/tests/mozbase/mozinstall 12:08:16 INFO - Unpacking c:\slave\test\build\tests\mozbase\mozleak 12:08:16 INFO - Running setup.py (path:c:\users\cltbld~1.t-w\appdata\local\temp\pip-xhoofi-build\setup.py) egg_info for package from file:///C:/slave/test/build/tests/mozbase/mozleak 12:08:16 INFO - Unpacking c:\slave\test\build\tests\mozbase\mozlog 12:08:16 INFO - Running setup.py (path:c:\users\cltbld~1.t-w\appdata\local\temp\pip-jex3i0-build\setup.py) egg_info for package from file:///C:/slave/test/build/tests/mozbase/mozlog 12:08:16 INFO - Unpacking c:\slave\test\build\tests\mozbase\moznetwork 12:08:16 INFO - Running setup.py (path:c:\users\cltbld~1.t-w\appdata\local\temp\pip-o10qeq-build\setup.py) egg_info for package from file:///C:/slave/test/build/tests/mozbase/moznetwork 12:08:16 INFO - Unpacking c:\slave\test\build\tests\mozbase\mozprocess 12:08:16 INFO - Running setup.py (path:c:\users\cltbld~1.t-w\appdata\local\temp\pip-a45gsp-build\setup.py) egg_info for package from file:///C:/slave/test/build/tests/mozbase/mozprocess 12:08:16 INFO - Unpacking c:\slave\test\build\tests\mozbase\mozprofile 12:08:16 INFO - Running setup.py (path:c:\users\cltbld~1.t-w\appdata\local\temp\pip-jmfvfb-build\setup.py) egg_info for package from file:///C:/slave/test/build/tests/mozbase/mozprofile 12:08:16 INFO - Unpacking c:\slave\test\build\tests\mozbase\mozrunner 12:08:16 INFO - Running setup.py (path:c:\users\cltbld~1.t-w\appdata\local\temp\pip-dxcp8p-build\setup.py) egg_info for package from file:///C:/slave/test/build/tests/mozbase/mozrunner 12:08:16 INFO - Unpacking c:\slave\test\build\tests\mozbase\mozscreenshot 12:08:16 INFO - Running setup.py (path:c:\users\cltbld~1.t-w\appdata\local\temp\pip-p3byh3-build\setup.py) egg_info for package from file:///C:/slave/test/build/tests/mozbase/mozscreenshot 12:08:16 INFO - Unpacking c:\slave\test\build\tests\mozbase\moztest 12:08:16 INFO - Running setup.py (path:c:\users\cltbld~1.t-w\appdata\local\temp\pip-diimgf-build\setup.py) egg_info for package from file:///C:/slave/test/build/tests/mozbase/moztest 12:08:17 INFO - Unpacking c:\slave\test\build\tests\mozbase\mozversion 12:08:17 INFO - Running setup.py (path:c:\users\cltbld~1.t-w\appdata\local\temp\pip-8clxfj-build\setup.py) egg_info for package from file:///C:/slave/test/build/tests/mozbase/mozversion 12:08:17 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 12:08:17 INFO - Running setup.py install for manifestparser 12:08:17 INFO - Installing manifestparser-script.py script to C:\slave\test\build\venv\Scripts 12:08:17 INFO - Installing manifestparser.exe script to C:\slave\test\build\venv\Scripts 12:08:17 INFO - Running setup.py install for mozcrash 12:08:18 INFO - Running setup.py install for mozdebug 12:08:18 INFO - Running setup.py install for mozdevice 12:08:18 INFO - Installing sutini-script.py script to C:\slave\test\build\venv\Scripts 12:08:18 INFO - Installing sutini.exe script to C:\slave\test\build\venv\Scripts 12:08:18 INFO - Installing dm-script.py script to C:\slave\test\build\venv\Scripts 12:08:18 INFO - Installing dm.exe script to C:\slave\test\build\venv\Scripts 12:08:19 INFO - Running setup.py install for mozfile 12:08:19 INFO - Running setup.py install for mozhttpd 12:08:19 INFO - Installing mozhttpd-script.py script to C:\slave\test\build\venv\Scripts 12:08:19 INFO - Installing mozhttpd.exe script to C:\slave\test\build\venv\Scripts 12:08:20 INFO - Running setup.py install for mozinfo 12:08:20 INFO - Installing mozinfo-script.py script to C:\slave\test\build\venv\Scripts 12:08:20 INFO - Installing mozinfo.exe script to C:\slave\test\build\venv\Scripts 12:08:21 INFO - Running setup.py install for mozInstall 12:08:21 INFO - Installing moz_remove_from_system-script.py script to C:\slave\test\build\venv\Scripts 12:08:21 INFO - Installing moz_remove_from_system.exe script to C:\slave\test\build\venv\Scripts 12:08:21 INFO - Installing mozuninstall-script.py script to C:\slave\test\build\venv\Scripts 12:08:21 INFO - Installing mozuninstall.exe script to C:\slave\test\build\venv\Scripts 12:08:21 INFO - Installing mozinstall-script.py script to C:\slave\test\build\venv\Scripts 12:08:21 INFO - Installing mozinstall.exe script to C:\slave\test\build\venv\Scripts 12:08:21 INFO - Installing moz_add_to_system-script.py script to C:\slave\test\build\venv\Scripts 12:08:21 INFO - Installing moz_add_to_system.exe script to C:\slave\test\build\venv\Scripts 12:08:21 INFO - Running setup.py install for mozleak 12:08:21 INFO - Running setup.py install for mozlog 12:08:22 INFO - Installing structlog-script.py script to C:\slave\test\build\venv\Scripts 12:08:22 INFO - Installing structlog.exe script to C:\slave\test\build\venv\Scripts 12:08:22 INFO - Running setup.py install for moznetwork 12:08:22 INFO - Installing moznetwork-script.py script to C:\slave\test\build\venv\Scripts 12:08:22 INFO - Installing moznetwork.exe script to C:\slave\test\build\venv\Scripts 12:08:23 INFO - Running setup.py install for mozprocess 12:08:23 INFO - Running setup.py install for mozprofile 12:08:24 INFO - Installing mozprofile-script.py script to C:\slave\test\build\venv\Scripts 12:08:24 INFO - Installing mozprofile.exe script to C:\slave\test\build\venv\Scripts 12:08:24 INFO - Installing diff-profiles-script.py script to C:\slave\test\build\venv\Scripts 12:08:24 INFO - Installing diff-profiles.exe script to C:\slave\test\build\venv\Scripts 12:08:24 INFO - Installing view-profile-script.py script to C:\slave\test\build\venv\Scripts 12:08:24 INFO - Installing view-profile.exe script to C:\slave\test\build\venv\Scripts 12:08:24 INFO - Running setup.py install for mozrunner 12:08:24 INFO - Installing mozrunner-script.py script to C:\slave\test\build\venv\Scripts 12:08:24 INFO - Installing mozrunner.exe script to C:\slave\test\build\venv\Scripts 12:08:25 INFO - Running setup.py install for mozscreenshot 12:08:25 INFO - Running setup.py install for moztest 12:08:26 INFO - Running setup.py install for mozversion 12:08:26 INFO - Installing mozversion-script.py script to C:\slave\test\build\venv\Scripts 12:08:26 INFO - Installing mozversion.exe script to C:\slave\test\build\venv\Scripts 12:08:26 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 12:08:26 INFO - Cleaning up... 12:08:26 INFO - Return code: 0 12:08:26 INFO - Installing None into virtualenv C:\slave\test\build/venv 12:08:26 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:08:26 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 12:08:26 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:08:26 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 12:08:26 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 0x0228C640>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x02333E30>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x0243E3B8>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x0237AE90>, '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 0x01CFA910>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x0281D520>, '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-059', 'USERDOMAIN': 'T-W864-IX-059', '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-059', 'LOCALAPPDATA': 'C:\\Users\\cltbld.T-W864-IX-059\\AppData\\Local', 'HOMEPATH': '\\Users\\cltbld.T-W864-IX-059', 'USERDOMAIN_ROAMINGPROFILE': 'T-W864-IX-059', 'MOZBUILDDIR': 'C:\\mozilla-build\\', 'PROGRAMW6432': 'C:\\Program Files', 'USERNAME': 'cltbld', 'LOGONSERVER': '\\\\T-W864-IX-059', '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-059\\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:08:26 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:08:26 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:08:26 INFO - Using env: {'ALLUSERSPROFILE': 'C:\\ProgramData', 12:08:26 INFO - 'APPDATA': 'C:\\Users\\cltbld.T-W864-IX-059\\AppData\\Roaming', 12:08:26 INFO - 'COMMONPROGRAMFILES': 'C:\\Program Files (x86)\\Common Files', 12:08:26 INFO - 'COMMONPROGRAMFILES(X86)': 'C:\\Program Files (x86)\\Common Files', 12:08:26 INFO - 'COMMONPROGRAMW6432': 'C:\\Program Files\\Common Files', 12:08:26 INFO - 'COMPUTERNAME': 'T-W864-IX-059', 12:08:26 INFO - 'COMSPEC': 'C:\\windows\\system32\\cmd.exe', 12:08:26 INFO - 'DCLOCATION': 'SCL3', 12:08:26 INFO - 'DNSSUFFIX': 'wintest.releng.scl3.mozilla.com', 12:08:26 INFO - 'FP_NO_HOST_CHECK': 'NO', 12:08:26 INFO - 'HOMEDRIVE': 'C:', 12:08:26 INFO - 'HOMEPATH': '\\Users\\cltbld.T-W864-IX-059', 12:08:26 INFO - 'KTS_HOME': 'C:\\Program Files\\KTS', 12:08:26 INFO - 'KTS_VERSION': '1.19c', 12:08:26 INFO - 'LOCALAPPDATA': 'C:\\Users\\cltbld.T-W864-IX-059\\AppData\\Local', 12:08:26 INFO - 'LOGONSERVER': '\\\\T-W864-IX-059', 12:08:26 INFO - 'MONDIR': 'C:\\Monitor_config\\', 12:08:26 INFO - 'MOZBUILDDIR': 'C:\\mozilla-build\\', 12:08:26 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 12:08:26 INFO - 'MOZ_NO_REMOTE': '1', 12:08:26 INFO - 'NO_EM_RESTART': '1', 12:08:26 INFO - 'NUMBER_OF_PROCESSORS': '8', 12:08:26 INFO - 'OS': 'Windows_NT', 12:08:26 INFO - 'OURDRIVE': 'C:', 12:08:26 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:08:26 INFO - 'PATHEXT': '.COM;.EXE;.BAT;.CMD;.VBS;.VBE;.JS;.JSE;.WSF;.WSH;.MSC', 12:08:26 INFO - 'PROCESSOR_ARCHITECTURE': 'x86', 12:08:26 INFO - 'PROCESSOR_ARCHITEW6432': 'AMD64', 12:08:26 INFO - 'PROCESSOR_IDENTIFIER': 'Intel64 Family 6 Model 30 Stepping 5, GenuineIntel', 12:08:26 INFO - 'PROCESSOR_LEVEL': '6', 12:08:26 INFO - 'PROCESSOR_REVISION': '1e05', 12:08:26 INFO - 'PROGRAMDATA': 'C:\\ProgramData', 12:08:26 INFO - 'PROGRAMFILES': 'C:\\Program Files (x86)', 12:08:26 INFO - 'PROGRAMFILES(X86)': 'C:\\Program Files (x86)', 12:08:26 INFO - 'PROGRAMW6432': 'C:\\Program Files', 12:08:26 INFO - 'PROMPT': '$P$G', 12:08:26 INFO - 'PROPERTIES_FILE': 'C:\\slave\\test/buildprops.json', 12:08:26 INFO - 'PSMODULEPATH': 'C:\\windows\\system32\\WindowsPowerShell\\v1.0\\Modules\\', 12:08:26 INFO - 'PUBLIC': 'C:\\Users\\Public', 12:08:26 INFO - 'PWD': 'C:\\slave\\test', 12:08:26 INFO - 'RUNLOGFILE': 'C:\\slave\\\\runslave.log', 12:08:26 INFO - 'SLAVEDIR': 'C:\\slave\\', 12:08:26 INFO - 'SYSTEMDRIVE': 'C:', 12:08:26 INFO - 'SYSTEMROOT': 'C:\\windows', 12:08:26 INFO - 'TEMP': 'C:\\Users\\CLTBLD~1.T-W\\AppData\\Local\\Temp', 12:08:26 INFO - 'TEST1': 'testie', 12:08:26 INFO - 'TMP': 'C:\\Users\\CLTBLD~1.T-W\\AppData\\Local\\Temp', 12:08:26 INFO - 'USERDOMAIN': 'T-W864-IX-059', 12:08:26 INFO - 'USERDOMAIN_ROAMINGPROFILE': 'T-W864-IX-059', 12:08:26 INFO - 'USERNAME': 'cltbld', 12:08:26 INFO - 'USERPROFILE': 'C:\\Users\\cltbld.T-W864-IX-059', 12:08:26 INFO - 'WINDIR': 'C:\\windows', 12:08:26 INFO - 'XPCOM_DEBUG_BREAK': 'warn'} 12:08:26 INFO - Ignoring indexes: https://pypi.python.org/simple/ 12:08:26 INFO - Unpacking c:\slave\test\build\tests\mozbase\manifestparser 12:08:26 INFO - Running setup.py (path:c:\users\cltbld~1.t-w\appdata\local\temp\pip-c6w6ox-build\setup.py) egg_info for package from file:///C:/slave/test/build/tests/mozbase/manifestparser 12:08:27 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:08:27 INFO - Unpacking c:\slave\test\build\tests\mozbase\mozcrash 12:08:27 INFO - Running setup.py (path:c:\users\cltbld~1.t-w\appdata\local\temp\pip-39m511-build\setup.py) egg_info for package from file:///C:/slave/test/build/tests/mozbase/mozcrash 12:08:27 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash==0.17 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:08:27 INFO - Unpacking c:\slave\test\build\tests\mozbase\mozdebug 12:08:27 INFO - Running setup.py (path:c:\users\cltbld~1.t-w\appdata\local\temp\pip-tv565n-build\setup.py) egg_info for package from file:///C:/slave/test/build/tests/mozbase/mozdebug 12:08:27 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:08:27 INFO - Unpacking c:\slave\test\build\tests\mozbase\mozdevice 12:08:27 INFO - Running setup.py (path:c:\users\cltbld~1.t-w\appdata\local\temp\pip-ho6g9b-build\setup.py) egg_info for package from file:///C:/slave/test/build/tests/mozbase/mozdevice 12:08:27 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdevice==0.48 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:08:27 INFO - Unpacking c:\slave\test\build\tests\mozbase\mozfile 12:08:27 INFO - Running setup.py (path:c:\users\cltbld~1.t-w\appdata\local\temp\pip-ndc82o-build\setup.py) egg_info for package from file:///C:/slave/test/build/tests/mozbase/mozfile 12:08:27 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:08:27 INFO - Unpacking c:\slave\test\build\tests\mozbase\mozhttpd 12:08:27 INFO - Running setup.py (path:c:\users\cltbld~1.t-w\appdata\local\temp\pip-eeueky-build\setup.py) egg_info for package from file:///C:/slave/test/build/tests/mozbase/mozhttpd 12:08:27 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:08:27 INFO - Unpacking c:\slave\test\build\tests\mozbase\mozinfo 12:08:27 INFO - Running setup.py (path:c:\users\cltbld~1.t-w\appdata\local\temp\pip-tqhqeh-build\setup.py) egg_info for package from file:///C:/slave/test/build/tests/mozbase/mozinfo 12:08:27 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:08:27 INFO - Unpacking c:\slave\test\build\tests\mozbase\mozinstall 12:08:27 INFO - Running setup.py (path:c:\users\cltbld~1.t-w\appdata\local\temp\pip-agijvs-build\setup.py) egg_info for package from file:///C:/slave/test/build/tests/mozbase/mozinstall 12:08:27 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:08:27 INFO - Unpacking c:\slave\test\build\tests\mozbase\mozleak 12:08:27 INFO - Running setup.py (path:c:\users\cltbld~1.t-w\appdata\local\temp\pip-nh_wrq-build\setup.py) egg_info for package from file:///C:/slave/test/build/tests/mozbase/mozleak 12:08:27 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:08:27 INFO - Unpacking c:\slave\test\build\tests\mozbase\mozlog 12:08:28 INFO - Running setup.py (path:c:\users\cltbld~1.t-w\appdata\local\temp\pip-ihszmc-build\setup.py) egg_info for package from file:///C:/slave/test/build/tests/mozbase/mozlog 12:08:28 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:08:28 INFO - Unpacking c:\slave\test\build\tests\mozbase\moznetwork 12:08:28 INFO - Running setup.py (path:c:\users\cltbld~1.t-w\appdata\local\temp\pip-kzupfo-build\setup.py) egg_info for package from file:///C:/slave/test/build/tests/mozbase/moznetwork 12:08:28 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:08:28 INFO - Unpacking c:\slave\test\build\tests\mozbase\mozprocess 12:08:28 INFO - Running setup.py (path:c:\users\cltbld~1.t-w\appdata\local\temp\pip-gl_7uh-build\setup.py) egg_info for package from file:///C:/slave/test/build/tests/mozbase/mozprocess 12:08:28 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:08:28 INFO - Unpacking c:\slave\test\build\tests\mozbase\mozprofile 12:08:28 INFO - Running setup.py (path:c:\users\cltbld~1.t-w\appdata\local\temp\pip-_zfbp_-build\setup.py) egg_info for package from file:///C:/slave/test/build/tests/mozbase/mozprofile 12:08:28 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:08:28 INFO - Unpacking c:\slave\test\build\tests\mozbase\mozrunner 12:08:28 INFO - Running setup.py (path:c:\users\cltbld~1.t-w\appdata\local\temp\pip-cy7h4b-build\setup.py) egg_info for package from file:///C:/slave/test/build/tests/mozbase/mozrunner 12:08:28 INFO - Requirement already satisfied (use --upgrade to upgrade): mozrunner==6.12 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:08:28 INFO - Unpacking c:\slave\test\build\tests\mozbase\mozscreenshot 12:08:28 INFO - Running setup.py (path:c:\users\cltbld~1.t-w\appdata\local\temp\pip-lc8sjg-build\setup.py) egg_info for package from file:///C:/slave/test/build/tests/mozbase/mozscreenshot 12:08:28 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:08:28 INFO - Unpacking c:\slave\test\build\tests\mozbase\moztest 12:08:28 INFO - Running setup.py (path:c:\users\cltbld~1.t-w\appdata\local\temp\pip-h3dfry-build\setup.py) egg_info for package from file:///C:/slave/test/build/tests/mozbase/moztest 12:08:28 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:08:28 INFO - Unpacking c:\slave\test\build\tests\mozbase\mozversion 12:08:28 INFO - Running setup.py (path:c:\users\cltbld~1.t-w\appdata\local\temp\pip-pw5viw-build\setup.py) egg_info for package from file:///C:/slave/test/build/tests/mozbase/mozversion 12:08:28 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:08:28 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.0 in c:\slave\test\build\venv\lib\site-packages (from mozcrash==0.17->-r C:\slave\test\build\tests\config\mozbase_requirements.txt (line 2)) 12:08:28 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.0 in c:\slave\test\build\venv\lib\site-packages (from mozcrash==0.17->-r C:\slave\test\build\tests\config\mozbase_requirements.txt (line 2)) 12:08:28 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:08:28 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in c:\slave\test\build\venv\lib\site-packages (from mozdevice==0.48->-r C:\slave\test\build\tests\config\mozbase_requirements.txt (line 4)) 12:08:28 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.19 in c:\slave\test\build\venv\lib\site-packages (from mozdevice==0.48->-r C:\slave\test\build\tests\config\mozbase_requirements.txt (line 4)) 12:08:28 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.4->-r C:\slave\test\build\tests\config\mozbase_requirements.txt (line 10)) 12:08:28 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:08:28 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:08:30 INFO - Downloading blessings-1.6.tar.gz 12:08:30 INFO - Running setup.py (path:C:\slave\test\build\venv\build\blessings\setup.py) egg_info for package blessings 12:08:30 INFO - Installing collected packages: blessings 12:08:30 INFO - Running setup.py install for blessings 12:08:30 INFO - Successfully installed blessings 12:08:30 INFO - Cleaning up... 12:08:33 INFO - Return code: 0 12:08:33 INFO - Done creating virtualenv C:\slave\test\build/venv. 12:08:33 INFO - Getting output from command: ['C:\\slave\\test\\build\\venv\\Scripts\\pip', 'freeze'] 12:08:33 INFO - Copy/paste: C:\slave\test\build\venv\Scripts\pip freeze 12:08:34 INFO - Reading from file tmpfile_stdout 12:08:34 INFO - Using _rmtree_windows ... 12:08:34 INFO - Using _rmtree_windows ... 12:08:34 INFO - Current package versions: 12:08:34 INFO - blessings == 1.6 12:08:34 INFO - blobuploader == 1.2.4 12:08:34 INFO - docopt == 0.6.1 12:08:34 INFO - functools32 == 3.2.3-2 12:08:34 INFO - jsonschema == 2.5.1 12:08:34 INFO - manifestparser == 1.1 12:08:34 INFO - mozInstall == 1.12 12:08:34 INFO - mozcrash == 0.17 12:08:34 INFO - mozdebug == 0.1 12:08:34 INFO - mozdevice == 0.48 12:08:34 INFO - mozfile == 1.2 12:08:34 INFO - mozhttpd == 0.7 12:08:34 INFO - mozinfo == 0.9 12:08:34 INFO - mozleak == 0.1 12:08:34 INFO - mozlog == 3.4 12:08:34 INFO - moznetwork == 0.27 12:08:34 INFO - mozprocess == 0.23 12:08:34 INFO - mozprofile == 0.28 12:08:34 INFO - mozrunner == 6.12 12:08:34 INFO - mozscreenshot == 0.1 12:08:34 INFO - mozsystemmonitor == 0.3 12:08:34 INFO - moztest == 0.7 12:08:34 INFO - mozversion == 1.4 12:08:34 INFO - psutil == 3.1.1 12:08:34 INFO - requests == 1.2.3 12:08:34 INFO - Installing None into virtualenv C:\slave\test\build/venv 12:08:34 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:08:34 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 12:08:34 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:08:34 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 12:08:34 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 0x0228C640>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x02333E30>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x0243E3B8>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x0237AE90>, '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 0x01CFA910>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x0281D520>, '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-059', 'USERDOMAIN': 'T-W864-IX-059', '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-059', 'LOCALAPPDATA': 'C:\\Users\\cltbld.T-W864-IX-059\\AppData\\Local', 'HOMEPATH': '\\Users\\cltbld.T-W864-IX-059', 'USERDOMAIN_ROAMINGPROFILE': 'T-W864-IX-059', 'MOZBUILDDIR': 'C:\\mozilla-build\\', 'PROGRAMW6432': 'C:\\Program Files', 'USERNAME': 'cltbld', 'LOGONSERVER': '\\\\T-W864-IX-059', '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-059\\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:08:34 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:08:34 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:08:34 INFO - Using env: {'ALLUSERSPROFILE': 'C:\\ProgramData', 12:08:34 INFO - 'APPDATA': 'C:\\Users\\cltbld.T-W864-IX-059\\AppData\\Roaming', 12:08:34 INFO - 'COMMONPROGRAMFILES': 'C:\\Program Files (x86)\\Common Files', 12:08:34 INFO - 'COMMONPROGRAMFILES(X86)': 'C:\\Program Files (x86)\\Common Files', 12:08:34 INFO - 'COMMONPROGRAMW6432': 'C:\\Program Files\\Common Files', 12:08:34 INFO - 'COMPUTERNAME': 'T-W864-IX-059', 12:08:34 INFO - 'COMSPEC': 'C:\\windows\\system32\\cmd.exe', 12:08:34 INFO - 'DCLOCATION': 'SCL3', 12:08:34 INFO - 'DNSSUFFIX': 'wintest.releng.scl3.mozilla.com', 12:08:34 INFO - 'FP_NO_HOST_CHECK': 'NO', 12:08:34 INFO - 'HOMEDRIVE': 'C:', 12:08:34 INFO - 'HOMEPATH': '\\Users\\cltbld.T-W864-IX-059', 12:08:34 INFO - 'KTS_HOME': 'C:\\Program Files\\KTS', 12:08:34 INFO - 'KTS_VERSION': '1.19c', 12:08:34 INFO - 'LOCALAPPDATA': 'C:\\Users\\cltbld.T-W864-IX-059\\AppData\\Local', 12:08:34 INFO - 'LOGONSERVER': '\\\\T-W864-IX-059', 12:08:34 INFO - 'MONDIR': 'C:\\Monitor_config\\', 12:08:34 INFO - 'MOZBUILDDIR': 'C:\\mozilla-build\\', 12:08:34 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 12:08:34 INFO - 'MOZ_NO_REMOTE': '1', 12:08:34 INFO - 'NO_EM_RESTART': '1', 12:08:34 INFO - 'NUMBER_OF_PROCESSORS': '8', 12:08:34 INFO - 'OS': 'Windows_NT', 12:08:34 INFO - 'OURDRIVE': 'C:', 12:08:34 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:08:34 INFO - 'PATHEXT': '.COM;.EXE;.BAT;.CMD;.VBS;.VBE;.JS;.JSE;.WSF;.WSH;.MSC', 12:08:34 INFO - 'PROCESSOR_ARCHITECTURE': 'x86', 12:08:34 INFO - 'PROCESSOR_ARCHITEW6432': 'AMD64', 12:08:34 INFO - 'PROCESSOR_IDENTIFIER': 'Intel64 Family 6 Model 30 Stepping 5, GenuineIntel', 12:08:34 INFO - 'PROCESSOR_LEVEL': '6', 12:08:34 INFO - 'PROCESSOR_REVISION': '1e05', 12:08:34 INFO - 'PROGRAMDATA': 'C:\\ProgramData', 12:08:34 INFO - 'PROGRAMFILES': 'C:\\Program Files (x86)', 12:08:34 INFO - 'PROGRAMFILES(X86)': 'C:\\Program Files (x86)', 12:08:34 INFO - 'PROGRAMW6432': 'C:\\Program Files', 12:08:34 INFO - 'PROMPT': '$P$G', 12:08:34 INFO - 'PROPERTIES_FILE': 'C:\\slave\\test/buildprops.json', 12:08:34 INFO - 'PSMODULEPATH': 'C:\\windows\\system32\\WindowsPowerShell\\v1.0\\Modules\\', 12:08:34 INFO - 'PUBLIC': 'C:\\Users\\Public', 12:08:34 INFO - 'PWD': 'C:\\slave\\test', 12:08:34 INFO - 'RUNLOGFILE': 'C:\\slave\\\\runslave.log', 12:08:34 INFO - 'SLAVEDIR': 'C:\\slave\\', 12:08:34 INFO - 'SYSTEMDRIVE': 'C:', 12:08:34 INFO - 'SYSTEMROOT': 'C:\\windows', 12:08:34 INFO - 'TEMP': 'C:\\Users\\CLTBLD~1.T-W\\AppData\\Local\\Temp', 12:08:34 INFO - 'TEST1': 'testie', 12:08:34 INFO - 'TMP': 'C:\\Users\\CLTBLD~1.T-W\\AppData\\Local\\Temp', 12:08:34 INFO - 'USERDOMAIN': 'T-W864-IX-059', 12:08:34 INFO - 'USERDOMAIN_ROAMINGPROFILE': 'T-W864-IX-059', 12:08:34 INFO - 'USERNAME': 'cltbld', 12:08:34 INFO - 'USERPROFILE': 'C:\\Users\\cltbld.T-W864-IX-059', 12:08:34 INFO - 'WINDIR': 'C:\\windows', 12:08:34 INFO - 'XPCOM_DEBUG_BREAK': 'warn'} 12:08:34 INFO - Ignoring indexes: https://pypi.python.org/simple/ 12:08:34 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:08:34 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:08:34 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:08:34 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:08:34 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:08:34 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:08:34 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:08:34 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:08:34 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:08:34 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:08:34 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:08:34 INFO - Cleaning up... 12:08:34 INFO - Return code: 0 12:08:34 INFO - Installing jsonschema into virtualenv C:\slave\test\build/venv 12:08:34 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:08:34 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 12:08:34 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:08:34 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 12:08:34 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 0x0228C640>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x02333E30>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x0243E3B8>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x0237AE90>, '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 0x01CFA910>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x0281D520>, 'level': 'critical'}], 'cwd': 'C:\\slave\\test\\build', 'env': {'TMP': 'C:\\Users\\CLTBLD~1.T-W\\AppData\\Local\\Temp', 'TEST1': 'testie', 'COMPUTERNAME': 'T-W864-IX-059', 'USERDOMAIN': 'T-W864-IX-059', '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-059', 'LOCALAPPDATA': 'C:\\Users\\cltbld.T-W864-IX-059\\AppData\\Local', 'HOMEPATH': '\\Users\\cltbld.T-W864-IX-059', 'USERDOMAIN_ROAMINGPROFILE': 'T-W864-IX-059', 'MOZBUILDDIR': 'C:\\mozilla-build\\', 'PROGRAMW6432': 'C:\\Program Files', 'USERNAME': 'cltbld', 'LOGONSERVER': '\\\\T-W864-IX-059', '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-059\\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:08:34 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:08:34 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:08:34 INFO - Using env: {'ALLUSERSPROFILE': 'C:\\ProgramData', 12:08:34 INFO - 'APPDATA': 'C:\\Users\\cltbld.T-W864-IX-059\\AppData\\Roaming', 12:08:34 INFO - 'COMMONPROGRAMFILES': 'C:\\Program Files (x86)\\Common Files', 12:08:34 INFO - 'COMMONPROGRAMFILES(X86)': 'C:\\Program Files (x86)\\Common Files', 12:08:34 INFO - 'COMMONPROGRAMW6432': 'C:\\Program Files\\Common Files', 12:08:34 INFO - 'COMPUTERNAME': 'T-W864-IX-059', 12:08:34 INFO - 'COMSPEC': 'C:\\windows\\system32\\cmd.exe', 12:08:34 INFO - 'DCLOCATION': 'SCL3', 12:08:34 INFO - 'DNSSUFFIX': 'wintest.releng.scl3.mozilla.com', 12:08:34 INFO - 'FP_NO_HOST_CHECK': 'NO', 12:08:34 INFO - 'HOMEDRIVE': 'C:', 12:08:34 INFO - 'HOMEPATH': '\\Users\\cltbld.T-W864-IX-059', 12:08:34 INFO - 'KTS_HOME': 'C:\\Program Files\\KTS', 12:08:34 INFO - 'KTS_VERSION': '1.19c', 12:08:34 INFO - 'LOCALAPPDATA': 'C:\\Users\\cltbld.T-W864-IX-059\\AppData\\Local', 12:08:34 INFO - 'LOGONSERVER': '\\\\T-W864-IX-059', 12:08:34 INFO - 'MONDIR': 'C:\\Monitor_config\\', 12:08:34 INFO - 'MOZBUILDDIR': 'C:\\mozilla-build\\', 12:08:34 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 12:08:34 INFO - 'MOZ_NO_REMOTE': '1', 12:08:34 INFO - 'NO_EM_RESTART': '1', 12:08:34 INFO - 'NUMBER_OF_PROCESSORS': '8', 12:08:34 INFO - 'OS': 'Windows_NT', 12:08:34 INFO - 'OURDRIVE': 'C:', 12:08:34 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:08:34 INFO - 'PATHEXT': '.COM;.EXE;.BAT;.CMD;.VBS;.VBE;.JS;.JSE;.WSF;.WSH;.MSC', 12:08:34 INFO - 'PROCESSOR_ARCHITECTURE': 'x86', 12:08:34 INFO - 'PROCESSOR_ARCHITEW6432': 'AMD64', 12:08:34 INFO - 'PROCESSOR_IDENTIFIER': 'Intel64 Family 6 Model 30 Stepping 5, GenuineIntel', 12:08:34 INFO - 'PROCESSOR_LEVEL': '6', 12:08:34 INFO - 'PROCESSOR_REVISION': '1e05', 12:08:34 INFO - 'PROGRAMDATA': 'C:\\ProgramData', 12:08:34 INFO - 'PROGRAMFILES': 'C:\\Program Files (x86)', 12:08:34 INFO - 'PROGRAMFILES(X86)': 'C:\\Program Files (x86)', 12:08:34 INFO - 'PROGRAMW6432': 'C:\\Program Files', 12:08:34 INFO - 'PROMPT': '$P$G', 12:08:34 INFO - 'PROPERTIES_FILE': 'C:\\slave\\test/buildprops.json', 12:08:34 INFO - 'PSMODULEPATH': 'C:\\windows\\system32\\WindowsPowerShell\\v1.0\\Modules\\', 12:08:34 INFO - 'PUBLIC': 'C:\\Users\\Public', 12:08:34 INFO - 'PWD': 'C:\\slave\\test', 12:08:34 INFO - 'RUNLOGFILE': 'C:\\slave\\\\runslave.log', 12:08:34 INFO - 'SLAVEDIR': 'C:\\slave\\', 12:08:34 INFO - 'SYSTEMDRIVE': 'C:', 12:08:34 INFO - 'SYSTEMROOT': 'C:\\windows', 12:08:34 INFO - 'TEMP': 'C:\\Users\\CLTBLD~1.T-W\\AppData\\Local\\Temp', 12:08:34 INFO - 'TEST1': 'testie', 12:08:34 INFO - 'TMP': 'C:\\Users\\CLTBLD~1.T-W\\AppData\\Local\\Temp', 12:08:34 INFO - 'USERDOMAIN': 'T-W864-IX-059', 12:08:34 INFO - 'USERDOMAIN_ROAMINGPROFILE': 'T-W864-IX-059', 12:08:34 INFO - 'USERNAME': 'cltbld', 12:08:34 INFO - 'USERPROFILE': 'C:\\Users\\cltbld.T-W864-IX-059', 12:08:34 INFO - 'WINDIR': 'C:\\windows', 12:08:34 INFO - 'XPCOM_DEBUG_BREAK': 'warn'} 12:08:34 INFO - Ignoring indexes: https://pypi.python.org/simple/ 12:08:34 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in c:\slave\test\build\venv\lib\site-packages 12:08:34 INFO - Cleaning up... 12:08:34 INFO - Return code: 0 12:08:34 INFO - Running post-action listener: _resource_record_post_action 12:08:34 INFO - Running post-action listener: _start_resource_monitoring 12:08:34 INFO - Starting resource monitoring. 12:08:34 INFO - [mozharness: 2016-10-14 19:08:34.857000Z] Finished create-virtualenv step (success) 12:08:34 INFO - [mozharness: 2016-10-14 19:08:34.857000Z] Running install step. 12:08:34 INFO - Running pre-action listener: _resource_record_pre_action 12:08:34 INFO - Running main action method: install 12:08:34 INFO - Getting output from command: ['C:\\slave\\test\\build\\venv\\Scripts\\pip', 'freeze'] 12:08:34 INFO - Copy/paste: C:\slave\test\build\venv\Scripts\pip freeze 12:08:35 INFO - Reading from file tmpfile_stdout 12:08:35 INFO - Using _rmtree_windows ... 12:08:35 INFO - Using _rmtree_windows ... 12:08:35 INFO - Detecting whether we're running mozinstall >=1.0... 12:08:35 INFO - Getting output from command: ['C:\\slave\\test\\build/venv/scripts/python', 'C:\\slave\\test\\build/venv/scripts/mozinstall-script.py', '-h'] 12:08:35 INFO - Copy/paste: C:\slave\test\build/venv/scripts/python C:\slave\test\build/venv/scripts/mozinstall-script.py -h 12:08:35 INFO - Reading from file tmpfile_stdout 12:08:35 INFO - Output received: 12:08:35 INFO - Usage: mozinstall-script.py [options] installer 12:08:35 INFO - Options: 12:08:35 INFO - -h, --help show this help message and exit 12:08:35 INFO - -d DEST, --destination=DEST 12:08:35 INFO - Directory to install application into. [default: 12:08:35 INFO - "C:\slave\test"] 12:08:35 INFO - --app=APP Application being installed. [default: firefox] 12:08:35 INFO - Using _rmtree_windows ... 12:08:35 INFO - Using _rmtree_windows ... 12:08:35 INFO - mkdir: C:\slave\test\build\application 12:08:35 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-52.0a1.en-US.win64.zip', '--destination', 'C:\\slave\\test\\build\\application'] 12:08:35 INFO - Copy/paste: C:\slave\test\build/venv/scripts/python C:\slave\test\build/venv/scripts/mozinstall-script.py C:\slave\test\build\firefox-52.0a1.en-US.win64.zip --destination C:\slave\test\build\application ProcessManager NOT managing child processes 12:08:37 INFO - Reading from file tmpfile_stdout 12:08:37 INFO - Output received: 12:08:37 INFO - C:\slave\test\build\application\firefox\firefox.exe 12:08:37 INFO - Using _rmtree_windows ... 12:08:37 INFO - Using _rmtree_windows ... 12:08:37 INFO - Running post-action listener: _resource_record_post_action 12:08:37 INFO - [mozharness: 2016-10-14 19:08:37.440000Z] Finished install step (success) 12:08:37 INFO - [mozharness: 2016-10-14 19:08:37.440000Z] Running run-tests step. 12:08:37 INFO - Running pre-action listener: _resource_record_pre_action 12:08:37 INFO - Running main action method: run_tests 12:08:37 INFO - Running command: ['C:\\slave\\test\\build\\venv\\Scripts\\python', '--version'] 12:08:37 INFO - Copy/paste: C:\slave\test\build\venv\Scripts\python --version 12:08:37 INFO - Python 2.7.3 12:08:37 INFO - Return code: 0 12:08:37 INFO - grabbing minidump binary from tooltool 12:08:37 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:08:37 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 0x0237AE90>, '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 0x01CFA910>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x0281D520>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': 'C:\\slave\\test\\build', 'privileged': False}, attempt #1 12:08:37 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:08:37 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:08:37 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:08:37 INFO - INFO - Attempting to fetch from 'https://api.pub.build.mozilla.org/tooltool/'... 12:08:37 INFO - INFO - File win32-minidump_stackwalk.exe fetched from https://api.pub.build.mozilla.org/tooltool/ as C:\slave\test\build\tmpjkcfkl 12:08:37 INFO - INFO - File integrity verified, renaming tmpjkcfkl to win32-minidump_stackwalk.exe 12:08:37 INFO - Return code: 0 12:08:37 INFO - Chmoding C:\slave\test\build\win32-minidump_stackwalk.exe to 0755 12:08:37 INFO - mkdir: C:\slave\test\build\blobber_upload_dir 12:08:37 INFO - ENV: MOZ_UPLOAD_DIR is now C:\slave\test\build\blobber_upload_dir 12:08:37 INFO - ENV: MINIDUMP_STACKWALK is now C:\slave\test\build\win32-minidump_stackwalk.exe 12:08:37 INFO - ENV: MINIDUMP_SAVE_PATH is now C:\slave\test\build\blobber_upload_dir 12:08:37 INFO - Running command: ['C:\\slave\\test\\build\\venv\\Scripts\\python', 'C:\\slave\\test\\build\\tests\\talos\\talos\\run_tests.py', '--branchName', 'Autoland', '--suite', 'dromaeojs', '--executablePath', 'C:\\slave\\test\\build\\application\\firefox\\firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/Tfvx-uL5Sl2RNwD0xeruXg/artifacts/public/build/firefox-52.0a1.en-US.win64.crashreporter-symbols.zip', '--title', 'T-W864-IX-059', '--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:08:37 INFO - Copy/paste: C:\slave\test\build\venv\Scripts\python C:\slave\test\build\tests\talos\talos\run_tests.py --branchName Autoland --suite dromaeojs --executablePath C:\slave\test\build\application\firefox\firefox --symbolsPath https://queue.taskcluster.net/v1/task/Tfvx-uL5Sl2RNwD0xeruXg/artifacts/public/build/firefox-52.0a1.en-US.win64.crashreporter-symbols.zip --title T-W864-IX-059 --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:08:37 INFO - Using env: {'ALLUSERSPROFILE': 'C:\\ProgramData', 12:08:37 INFO - 'APPDATA': 'C:\\Users\\cltbld.T-W864-IX-059\\AppData\\Roaming', 12:08:37 INFO - 'COMMONPROGRAMFILES': 'C:\\Program Files (x86)\\Common Files', 12:08:37 INFO - 'COMMONPROGRAMFILES(X86)': 'C:\\Program Files (x86)\\Common Files', 12:08:37 INFO - 'COMMONPROGRAMW6432': 'C:\\Program Files\\Common Files', 12:08:37 INFO - 'COMPUTERNAME': 'T-W864-IX-059', 12:08:37 INFO - 'COMSPEC': 'C:\\windows\\system32\\cmd.exe', 12:08:37 INFO - 'DCLOCATION': 'SCL3', 12:08:37 INFO - 'DNSSUFFIX': 'wintest.releng.scl3.mozilla.com', 12:08:37 INFO - 'FP_NO_HOST_CHECK': 'NO', 12:08:37 INFO - 'HOMEDRIVE': 'C:', 12:08:37 INFO - 'HOMEPATH': '\\Users\\cltbld.T-W864-IX-059', 12:08:37 INFO - 'KTS_HOME': 'C:\\Program Files\\KTS', 12:08:37 INFO - 'KTS_VERSION': '1.19c', 12:08:37 INFO - 'LOCALAPPDATA': 'C:\\Users\\cltbld.T-W864-IX-059\\AppData\\Local', 12:08:37 INFO - 'LOGONSERVER': '\\\\T-W864-IX-059', 12:08:37 INFO - 'MINIDUMP_SAVE_PATH': 'C:\\slave\\test\\build\\blobber_upload_dir', 12:08:37 INFO - 'MINIDUMP_STACKWALK': 'C:\\slave\\test\\build\\win32-minidump_stackwalk.exe', 12:08:37 INFO - 'MONDIR': 'C:\\Monitor_config\\', 12:08:37 INFO - 'MOZBUILDDIR': 'C:\\mozilla-build\\', 12:08:37 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 12:08:37 INFO - 'MOZ_NO_REMOTE': '1', 12:08:37 INFO - 'MOZ_UPLOAD_DIR': 'C:\\slave\\test\\build\\blobber_upload_dir', 12:08:37 INFO - 'NO_EM_RESTART': '1', 12:08:37 INFO - 'NUMBER_OF_PROCESSORS': '8', 12:08:37 INFO - 'OS': 'Windows_NT', 12:08:37 INFO - 'OURDRIVE': 'C:', 12:08:37 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:08:37 INFO - 'PATHEXT': '.COM;.EXE;.BAT;.CMD;.VBS;.VBE;.JS;.JSE;.WSF;.WSH;.MSC', 12:08:37 INFO - 'PROCESSOR_ARCHITECTURE': 'x86', 12:08:37 INFO - 'PROCESSOR_ARCHITEW6432': 'AMD64', 12:08:37 INFO - 'PROCESSOR_IDENTIFIER': 'Intel64 Family 6 Model 30 Stepping 5, GenuineIntel', 12:08:37 INFO - 'PROCESSOR_LEVEL': '6', 12:08:37 INFO - 'PROCESSOR_REVISION': '1e05', 12:08:37 INFO - 'PROGRAMDATA': 'C:\\ProgramData', 12:08:37 INFO - 'PROGRAMFILES': 'C:\\Program Files (x86)', 12:08:37 INFO - 'PROGRAMFILES(X86)': 'C:\\Program Files (x86)', 12:08:37 INFO - 'PROGRAMW6432': 'C:\\Program Files', 12:08:37 INFO - 'PROMPT': '$P$G', 12:08:37 INFO - 'PROPERTIES_FILE': 'C:\\slave\\test/buildprops.json', 12:08:37 INFO - 'PSMODULEPATH': 'C:\\windows\\system32\\WindowsPowerShell\\v1.0\\Modules\\', 12:08:37 INFO - 'PUBLIC': 'C:\\Users\\Public', 12:08:37 INFO - 'PWD': 'C:\\slave\\test', 12:08:37 INFO - 'PYTHONPATH': 'C:\\slave\\test\\build\\tests\\talos', 12:08:37 INFO - 'RUNLOGFILE': 'C:\\slave\\\\runslave.log', 12:08:37 INFO - 'SLAVEDIR': 'C:\\slave\\', 12:08:37 INFO - 'SYSTEMDRIVE': 'C:', 12:08:37 INFO - 'SYSTEMROOT': 'C:\\windows', 12:08:37 INFO - 'TEMP': 'C:\\Users\\CLTBLD~1.T-W\\AppData\\Local\\Temp', 12:08:37 INFO - 'TEST1': 'testie', 12:08:37 INFO - 'TMP': 'C:\\Users\\CLTBLD~1.T-W\\AppData\\Local\\Temp', 12:08:37 INFO - 'USERDOMAIN': 'T-W864-IX-059', 12:08:37 INFO - 'USERDOMAIN_ROAMINGPROFILE': 'T-W864-IX-059', 12:08:37 INFO - 'USERNAME': 'cltbld', 12:08:37 INFO - 'USERPROFILE': 'C:\\Users\\cltbld.T-W864-IX-059', 12:08:37 INFO - 'WINDIR': 'C:\\windows', 12:08:37 INFO - 'XPCOM_DEBUG_BREAK': 'warn'} 12:08:37 INFO - Calling ['C:\\slave\\test\\build\\venv\\Scripts\\python', 'C:\\slave\\test\\build\\tests\\talos\\talos\\run_tests.py', '--branchName', 'Autoland', '--suite', 'dromaeojs', '--executablePath', 'C:\\slave\\test\\build\\application\\firefox\\firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/Tfvx-uL5Sl2RNwD0xeruXg/artifacts/public/build/firefox-52.0a1.en-US.win64.crashreporter-symbols.zip', '--title', 'T-W864-IX-059', '--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:08:38 INFO - mozversion application_buildid: 20161014093007 12:08:38 INFO - mozversion application_changeset: c5b1bfd47d15f4e2c475d18e1987b7284cea9084 12:08:38 INFO - mozversion application_display_name: Nightly 12:08:38 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 12:08:38 INFO - mozversion application_name: Firefox 12:08:38 INFO - mozversion application_remotingname: firefox 12:08:38 INFO - mozversion application_repository: https://hg.mozilla.org/integration/autoland 12:08:38 INFO - mozversion application_vendor: Mozilla 12:08:38 INFO - mozversion application_version: 52.0a1 12:08:38 INFO - mozversion platform_buildid: 20161014093007 12:08:38 INFO - mozversion platform_changeset: c5b1bfd47d15f4e2c475d18e1987b7284cea9084 12:08:38 INFO - mozversion platform_repository: https://hg.mozilla.org/integration/autoland 12:08:38 INFO - mozversion platform_version: 52.0a1 12:08:38 INFO - using testdate: 1476472118 12:08:38 INFO - actual date: 1476472118 12:08:38 INFO - starting webserver on 'localhost:49270' 12:08:38 INFO - SUITE-START | Running 2 tests 12:08:38 INFO - TEST-START | dromaeo_css 12:08:38 INFO - operating with platform_type : w8_ 12:08:38 INFO - Initialising browser for dromaeo_css test... 12:08:39 INFO - TEST-INFO | started process 1396 (C:\slave\test\build\application\firefox\firefox -profile c:\users\cltbld~1.t-w\appdata\local\temp\tmprz74rj\profile http://localhost:49270/getInfo.html) 12:08:46 INFO - PROCESS | 1396 | __metrics Screen width/height:1600/1200 12:08:46 INFO - PROCESS | 1396 | colorDepth:24 12:08:46 INFO - PROCESS | 1396 | Browser inner width/height: 1010/674 12:08:46 INFO - PROCESS | 1396 | __metrics 12:08:48 INFO - PROCESS | 1396 | JavaScript error: resource://gre/modules/AsyncShutdown.jsm, line 693: Error: Phase "quit-application-granted" is finished, it is too late to register completion condition "SessionStore: flushing all windows" 12:08:48 INFO - PROCESS | 1396 | JavaScript error: resource://app/modules/BrowserUsageTelemetry.jsm, line 181: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 12:08:49 INFO - TEST-INFO | 1396: exit 0 12:08:49 INFO - Browser initialized. 12:08:49 INFO - Running cycle 1/1 for dromaeo_css test... 12:08:49 INFO - TEST-INFO | started process 1728 (C:\slave\test\build\application\firefox\firefox -profile c:\users\cltbld~1.t-w\appdata\local\temp\tmprz74rj\profile -tp file:\C:\slave\test\build\tests\talos\talos\tests\dromaeo\css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 12:08:49 INFO - PROCESS | 1728 | [GFX1-]: Invalid size in UpdateRenderTarget Size(124,0), 0 12:09:00 INFO - PROCESS | 1728 | RSS: Main: 161153024 12:09:00 INFO - PROCESS | 1728 | 12:09:52 INFO - PROCESS | 1728 | 1476472192296 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:12:01 INFO - PROCESS | 1728 | Cycle 1(1): loaded http://localhost:49270/tests/dromaeo/cssquery-dojo.html (next: http://localhost:49270/tests/dromaeo/cssquery-ext.html) 12:12:04 INFO - PROCESS | 1728 | RSS: Main: 355860480 12:12:04 INFO - PROCESS | 1728 | 12:15:06 INFO - PROCESS | 1728 | Cycle 1(1): loaded http://localhost:49270/tests/dromaeo/cssquery-ext.html (next: http://localhost:49270/tests/dromaeo/cssquery-jquery.html) 12:15:07 INFO - PROCESS | 1728 | RSS: Main: 227545088 12:15:07 INFO - PROCESS | 1728 | 12:18:09 INFO - PROCESS | 1728 | Cycle 1(1): loaded http://localhost:49270/tests/dromaeo/cssquery-jquery.html (next: http://localhost:49270/tests/dromaeo/cssquery-mootools.html) 12:18:10 INFO - PROCESS | 1728 | RSS: Main: 176226304 12:18:10 INFO - PROCESS | 1728 | 12:21:12 INFO - PROCESS | 1728 | Cycle 1(1): loaded http://localhost:49270/tests/dromaeo/cssquery-mootools.html (next: http://localhost:49270/tests/dromaeo/cssquery-prototype.html) 12:21:12 INFO - PROCESS | 1728 | RSS: Main: 181936128 12:21:12 INFO - PROCESS | 1728 | 12:24:15 INFO - PROCESS | 1728 | Cycle 1(1): loaded http://localhost:49270/tests/dromaeo/cssquery-prototype.html (next: http://localhost:49270/tests/dromaeo/cssquery-yui.html) 12:24:16 INFO - PROCESS | 1728 | RSS: Main: 168128512 12:24:16 INFO - PROCESS | 1728 | 12:27:19 INFO - PROCESS | 1728 | Cycle 1(1): loaded http://localhost:49270/tests/dromaeo/cssquery-yui.html (next: http://localhost:49270/tests/dromaeo/cssquery-dojo.html) 12:27:19 INFO - PROCESS | 1728 | RSS: Main: 231792640 12:27:19 INFO - PROCESS | 1728 | 12:27:19 INFO - PROCESS | 1728 | __start_tp_report 12:27:19 INFO - PROCESS | 1728 | _x_x_mozilla_page_load 12:27:19 INFO - PROCESS | 1728 | _x_x_mozilla_page_load_details 12:27:19 INFO - PROCESS | 1728 | |i|pagename|runs| 12:27:19 INFO - PROCESS | 1728 | |0;dojo.html;2093.7173481579994;2809.69093399726;2830.3773169902615;2860.7425331720146;2862.541993281074;5030.647854650176;5058.747062646871;5069.873253168673;5074.314967479389;5076.796928122871;4828.637852161084;5058.873528161797;5071.999999999991;5105.56602688771;5162.664426812264;4490.326451032339;4532.932006019904;4535.501094879561;4553.635709143261;4634.976825115869;4478.373027776114;4527.29826876833;4555.24838401665;4573.085382923412;4611.976940115294;397.0001227091287;4534.251848445003;4559.088182363524;4567.748773817439;4591.334256532801;4458.063806600618;4470.038941627566;4514.45826500822;4521.63826893851;4529.547045295444;4472.508024117377;4488.079943611552;4523.819047238107;4551;4585.862424127282;5054.797808087672;5058.038972595195;5069.974650126763;5085.720285384303;5121.769520371592;5141.048905952411;5193.766280517386;5197.818076367309;5282.524572788429;5304.708241046741;5390;5406.351237851443;5409.540189083893;5413.945860541384;5478.096114141202;4790.5448982346625;4891.364122664102;4972.776225069881;4977.950220497785;4988.6757360771435;5370.140777475585;5399.190121481809;5410.404855465896;5465.262189604432;5471.808486703026;5195.090859099642;5235.816746413933;5248.63259571834;5251.842444726664;5269.051570717231;5339.3058902342445;5346.599005074635;5351.063563876306;5351.277577527062;5353.437889021597;5299.417064122943;5309.309789727311;5312;5313.388960269541;5334.1732031535175;5274.050670879202;5303.522682958553;5307.761150748225;5314.787408503694;5323.494268044529;3594.9281014379567;3595.17311018462;3604.9098772530374;3608.278344331144;3611.4582812578324;3209.1656169396124;3226.6773322667545;3228.6448490666007;3292.2921571862166;3294.1105901406486;5012.398512178562;5078.212877003996;5086.949130508721;5087.592992560586;5152.252923326097;5290.074237008508;5300.655457395257;5436.864078397993;5453.64551304164;5458.727063646802;4891.755412229374;5026.673266237683;5038.64729468941;5043.9747801260755;5049.798008079636;4420.7126536775;4469.9553004469535;4475.194464996267;4483.932741008887;4535.63714902807;5407.621466497308;5557.305336832896;5571.693556854412;5572.442755724395;5631.239782629293;5293.973530132324;5317.707526085947;5319.787208511616;5322.813701520428;5388.622796404214;5479.945200547943;5494.423085576117;5508.779648814163;5514.476124768141;5524.806631767869;5250.816221432232;5262.10544207478;5270.525652691276;5283.735813209248;5295.523402893758;5277.366715994105;5344.625876188629;5346.331708536433;5372.247885296139;5386.13821788512;5234.241035049972;5244.423113457593;5254;5259.184826351921;5260.579153667774;5179.663321884065;5182.32629758129;5205.895882082413;5238.266642669953;5248.396434409939;5183.974080129575;5198.402183748766;5199.4020687621405;5201.375834899836;5210.791568337224;5240.082985477602;5255.500727430888;5257.921131183112;5259.894802104013;5263;5265.236540701653;5294.470552944675;5300.3904550975585;5308.389535203501;5312.893742125058 12:27:19 INFO - PROCESS | 1728 | |1;ext.html;534.2360424592832;543.630331374665;545.3646501825374;546.6583385384135;573.3406582430207;33301;36609.267814643725;37105.81447092761;37113.99999999996;37168.53977522701;36966.63033369665;37338.62661373385;37420;37431.812840935825;37461.625383746155;8280.171982801718;8390.2868256198;8424.87362689557;8436.45163064402;8438.78903027423;8223.671053157866;8244.340452763765;8326.458780179299;8329.66681332746;8338.916610833874;8359.955005624297;8388.07731149573;8391.286740627054;8425.325973922103;8428.115047919971;8356.540390278533;8372.330213582898;8386.664533418656;8390.454620449651;8402.663893444254;8368.539730314831;8373.95813020937;8434.198751118634;8436.156384361577;8451.239388455007;34382;34631.82684086564;34654.13364665904;34674;34695.30609387798;3011.5031019881694;3063.2954420483416;3073.1702440340982;3169.8415079245947;3308.6195087564756;28454.715452845412;29032.854835725688;29670;29802.85098574515;29851;3695.722820788452;3777.1690228150037;3790.075841380878;3840.615938406165;4089.325261331877;275562;276469;277445;279382;279454.99999999796;46002.53997460049;46188.76905615518;46661;46664.300035499495;46676.7666161667;29941.40117197644;30763;30805.22986925345;31843;32074.67925320717;14348.713025739427;14431.20628365429;14432.927835360755;14479.927600362142;14490.637734056521;10957.780844383067;11019.724506887393;11065;11081.889181108247;11090.390028548345;15742.92128539373;15772.68454630901;15788.447404340794;15819.762703559456;15940.601484962968;6195.96902015496;6212.565120441525;6282.937170628326;6285.114465660375;6296.937030629727;768.3622593247591;835.7367429259764;858.4548811504615;861.4917198852708;915.5742579700471;25395.746042539336;25716.3570910725;26643.067492637663;26707.19878403651;26777.330566735596;916.2807196350833;922.5064590444081;926.3561824531886;928.6703220356676;970.2674480767117;13927;13938.372773225026;13970.301484925916;14066.788998165035;14194.716105677828;335929;336771;339743;340273;340393;44495.33257001147;44890;44966.77516612396;45006.77496612496;45050.77474612606;959.2661613865398;1062.1874266186373;1086.5327908999207;1086.5653738504661;1117.2067831839322;22717.545649087257;27934.580981285704;28585.28536786597;29717;30596.694033060274;44187.33718994282;44735.55264447444;44737;44811.55188448204;44813.32780008237;348349;350464.4396228474;350676;350692;351013;21187.36437906865;21388.35834924955;21902;24023.75976240215;24403.29176957596;37179.62820371761;38984.80507597557;39405;40231.396529052676;40582.59417405788;33693.83153084219;34215.31569368549;34280;34538.654613453546;34679.82660086784;33976;34139.82930085433;34144.317113658086;34194.48708269428;34719.13202169966;27868;33156.679032467495;33368.49947250744;33615.66384336125;34188.31623367469;29949.85025074861;31372.843135784176;31372.843135784176;31483.96256598933;31539.84230078835;23559.411014724083;23780.88109559441;23797.881010594836;23822.6186052273;24220.39449013789 12:27:19 INFO - PROCESS | 1728 | |2;jquery.html;306.27413031116254;308.41863088078964;311.47050014974536;314.6743120869899;323.5534961752782;15778.211089445525;16076.598085047865;16894.155292235402;16985.15074246289;17044.659106817857;15221.39114435424;15655;15683.686326273497;15877.285522151502;15916.283767230474;4725.243960966246;4863.659543831933;4867.221244600864;4946;5240.502152295545;5205.27126202332;5274.103402421579;5293.200311893956;5296.894062118756;5304.336957880265;5059.949400505985;5220.295260139889;5232.084385232588;5232.973835130819;5250.894982100355;5250.553702935255;5288.233206185082;5288.312519372457;5291.04761142996;5292.894142117156;4439.134368798085;4671.135839869601;4674.462436819776;4675.4155730533685;4692.530746925314;10819;10846.511906964206;10991.61529346477;11001.064909482704;11024.724381890517;1880.454668146236;1935.5512145658554;1954.3355259211794;2152.6232909240975;2432.939176520601;8077.434579579432;8100.47346922454;8109.229623185788;8181.059178194524;11179.049780768644;1716.3220527891413;1768.9292428302851;1783.973240401395;1791.1492041280417;1804.5669039430443;68229.65885170542;70425.64787176083;70612.64693676498;71462.64268678728;74139.62930185314;8308.70919517826;8335.291265290602;8369.623366948503;8539.615717292736;8563.229309362187;10853.403062831461;10870.293430926964;10946.343219406703;10949.781004379867;10954.123670106372;6651.833704157435;6677.265500794909;6725.19297684281;6804.795856124324;6818.2159051708695;6776.966115169491;6777.2545020047755;6878.34655707717;6883.586984780929;6902.827429314207;3411.7100046496325;3443.707284880763;3478.5999610044664;3482.3209474152295;3492.022233774547;1610.8308627594167;1639.721247387923;1650.1996531682125;1653.4791540664653;1701.9404320848712;765.9770206893802;777.2577188784697;794.0352471746739;801.7073768074728;817.0522194254755;15822;16308.266128024268;16439.424620138238;16676.416325428796;17090.572735681708;792.6195426195459;826.3224156191985;849.524266410812;851.855184618604;893.5308962794585;8885.155910188521;9244.630214791467;9260.629574817067;9315.115064068903;9426.670066547638;381699;386113;390386;393618;395566;53008.734956325745;75257;76043.23956760472;76131;76839.61580192063;827.0571548434789;844.9788755281044;848.9787755306166;849.3035710717153;875.5359659380539;14620;14684.192369419785;14691.907833002866;14895.329710162852;14940.17829019371;33527.66472335343;34873.65126348704;36313;37992.430113547765;38049;47774.283385749935;48264.7586762078;48531;48751.26873096835;49116.50883491262;6915.861682766417;6997.160340759141;7053.823654408681;7332.30343117403;7393.963030184815;11194.620844228613;11512.42437878086;11984.940075299917;12069.517219311128;12396.070294727751;10218.846717299395;10270.794584108127;10272.486375681336;10286.074253316938;10525.947405259412;9818.509074546388;10088.848667270144;10357.637482688371;10483.21375896826;10522.894771052497;10228.386296822215;10259.640912568024;10615.734606634896;10653.57385704563;10888.29226100301;6867.416269617139;7073.1865835427525;7126.35862772353;7182.281771822985;7399.8150046249275;7453.813654658677;10035.598576056876;10245.897541024495;10250.487475626338;10351.120154786928 12:27:19 INFO - PROCESS | 1728 | |3;mootools.html;1135.1372956553016;1165.7027457998208;1177.99411002945;1242.5464705382535;1428.32154726505;6420.133282006934;6869.210040845298;7082.150141982963;7098.148222213329;7232.529885557435;7050.471214658895;7097.183823860258;7116.110486189226;7121.85756284874;7156.463265255114;1922.4809301488624;1939.6508628446875;1947.6299503094438;1947.9318223862167;1948.9707654385195;1880.2572983671441;1905.8951757653324;1906.1041310584003;1910.8471322294183;1916.626257879714;1884.2274667386375;1889.650414673283;1893.2521653946683;1896.8672192946499;1897.5445892985722;1831.7069268916975;1885.7454243677134;1886.7830199527093;1888.5089876632037;1891.8959457229917;1770.194561474539;1779.7363871651144;1782.8128046555055;1818.709006558944;1875.4373687893715;7009.929900700979;7097.077379940626;7180.461465390116;7233.45749068822;7236.782896513113;4064.878053658395;4212.30496968003;4220.620144187038;4224.281872081753;4232.365145228209;2712.9864350678317;2778.2082106599723;2808.1294798612494;2819.647544056993;2828.4343131373807;900.7207765592622;913.4154141349542;913.4747520175926;920.4017388697333;922.1654402765508;9693.273004524688;9717.31978761487;9767.755806104833;9777.31558790885;9779.315447918649;3402.795832250073;3497.283056973314;3613.0967258185456;3622.438522029037;3630.727695422801;7622.847543049219;7679.385649148055;7697.576633285111;7700.3454706350585;7706.036745406825;4141.461609990682;4154.376843473503;4161.417401563784;4180.393842892824;4185.162967406531;3509.964900351015;3611.8194090295906;3962.108525581721;3971.6425521703186;3980.920381592352;2919.678835328112;2998.970010299869;3020.3808219314988;3031.8332491712727;3048.2531779714113;877.7366789962986;880.9956649419667;884.9115088491228;893.3032234856822;904.6788390121544;651.7458191305394;705.9199424879839;707.5683832861951;718.741253148866;747.025132202481;4453.487848897418;4524.864254072318;4636.374089497942;4647.395838540968;4647.697899636512;786.2648423723837;794.6860989908954;796.8406318736276;800.3637108498641;820.5199958024504;2963.5110206815634;3109.0983614751467;3127.3745250949446;3148.685131486833;3186.060112266887;8016.438849280495;8513.914860851311;8515.105913879077;8516.574171291411;8546.35902307317;8297.58512074394;8439;8469.32245420365;8483.278921291636;8492.660293588311;6378.872422551523;6422.839429014312;6424.743010279536;6436.452901503331;6459.224893012869;4429.402030725811;4438.53395393492;4446;4480.6415486760325;4519.23173060587;7518.135414427192;7704.30661240491;7726.304632583095;7853;7854.960725196337;7747.380209583107;7937.087234968052;7973.561454120079;8030.196980301923;8052.758417247492;5884.293884733688;5897.203877476657;5907.734151963086;5911.408859114054;5947.494462970696;6393.840153996187;6498.512611554058;7035.33164349386;7059.5058345915295;7172.175199851875;6488.545801793829;6536.117624120683;6546.625208706225;6614.239362473377;6639.170103737033;6296.5592408530965;6323.905141422791;6363.840903977252;6401.679916004088;6519.576227545194;5670.886582268249;5742.483176514133;5753.453421924911;5762.971185144047;5791.82624521265;3604.6575575320303;3613.0967258185456;3656.433252845813;3665.9266814663024;3681.5214022176947;3746.85012599493;3772.0946972726897;3841.5390153181797;3894.6494815466745;3928.626780455852 12:27:19 INFO - PROCESS | 1728 | |4;prototype.html;254.31462209345813;257.8259674719564;258.77874417373147;260.98042646801497;261.0575821285161;5075.111855425304;5124.308218390525;5134.306868572741;5140.8971820563565;5145.253938178962;5037.269595908591;5056.823011194609;5065.113605119099;5068.239764035397;5070.923936140961;3643.544556930384;3740.1023754299044;3751.268502641986;3825.349690552599;3837.7889216093104;3820.617938206171;3821.216650586637;3832.42513622956;3832.42513622956;3850.7497012694225;3818.8281527331337;3824.7513911595656;3833.0225792422893;3835.564416595454;3839.8656047038357;3629.3467175908327;3703.6481534254203;3809;3854.7879866607327;3858.614138586147;3208.16587687203;3232.305054413289;3247.983760081208;3270.2013892359346;3278.1968417737808;4998.075356059141;4998.325226094467;5015.172496538067;5026.447090820006;5069.315642388304;4087.223427548786;4326.545712700184;4378.9562104378865;4389.385486031926;4400.44994375703;5331.866703332447;5359.196120581905;5381.3811411687375;5386.245925570423;5391.838244852661;3509.175343794206;3529.38235808735;3534.7879127252445;3538.0540702613716;3540.5574303212097;5523.337199536041;5634.01397259449;5666.121751128581;5706.857328566777;5726.742296596663;3519.9472007919903;3548.237129017222;3558.448440491728;3560.8219589020446;3562.2341196642847;3592.3174596827043;3607.6211997740384;3615;3620.221652344706;3620.9275814483562;4302.677299202573;4307.612314891612;4315.546867578922;4330.631896288788;4339.804708788112;5254.65844720092;5362.9084656983805;5414.756335964891;5424.810131645373;5455.645383050089;1232.2360136715295;1248.831407759959;1254.1346470935025;1259.817326487654;1267.1700036476122;747.7794050755041;759.9512672511898;770.6300975531776;778.4161878591057;782.338923609549;4611.077784443058;4974.676646017997;5105.723569107723;5138.2806407103035;5255.78976840922;5570.192322113271;5601.075822489243;5614.354349249807;5626.859328516738;5636.943630563724;5114.130597798383;5220.660657057279;5236.6334356595435;5257.34393665994;5270.789168433296;2946.720061594145;2950.763938884927;2968.3618022124915;2975.613170287892;2984.686607906182;5744.684042377709;5753.769849205984;5754.625949313281;5761.308642962787;5762.308522977186;5419.674819510763;5638.97180514103;5687.175359572839;5687.705782134462;5717.971410143005;5680.261565996394;5718.370979192368;5718.399568045378;5731.8567035824435;5742.827715168552;5581.744107575763;5589.972050139723;5598.748056337393;5601.41185175567;5603.635763675511;5205.817796377109;5505.724713764215;5530;5536.501714845684;5548.306461692288;5821.563382746395;5825.165073001991;5836.80345529157;5850.2102216200265;5863.501602363847;3465.8960231193105;3541.9291614167055;3560.074380660995;3562.340966921128;3563.2873425314524;5599.636023658449;5641.520470759867;5647.124695672177;5655.095184770417;5662.433756624469;5485.451454854483;5496.6701997880255;5518.862028449321;5520.1167813151305;5528.502434780889;5354.196870469305;5452.345718513804;5479.972600136974;5509.889802204014;5528.55771538284;5390.601182473762;5439.211314359475;5441.972790136024;5453.727313634382;5466.426025267289;5264.815731449381;5400.324959380077;5415.972920135374;5467.890642187213;5510.5316048134755;5036.370453693288;5311.9468805313;5417.322834645669;5485.518909894226;5490.396056433709 12:27:19 INFO - PROCESS | 1728 | |5;yui.html;612.9478994285486;619.817153939588;696.9651517424128;697.2742462405544;714.9249328820475;13362.19826810392;13975.371108300138;14057.578272651812;14096.929515352434;14157.433702651882;14438.927805360958;14538.34577444015;14774.63063423415;14775.48285809997;14794.112353258812;559.2310572962177;579.9739011744482;647.3623480871349;663.9966800165993;669.2370697404962;623.0125251476416;624.5596854217788;652.2368828470677;655.6623338980429;659.2715049869896;694.6110178300169;696.6481926627047;697.8011266788966;700.8142842146835;701.4283359062373;590.5334785519434;601.0863487498978;691.7924622613222;695.5061906046712;695.5444184059423;461.40248378350117;466.60571816814735;467.7170311961248;493.4645909188535;494.2956287290597;13249.668758281025;13275.601731948056;13297.800532992012;13316.733665326736;13318.400671969785;11617.302961822317;11830.349330786803;11839;11996.100292478099;12471.376431178405;12379;12435.12954093214;12436.440360183813;12575.308358040304;12603.117781755282;4145.606167414091;4164.646005089541;4193.32906734924;4257.063446041866;4264.65882729384;72163;72794;74487.62756186239;75521;75629.62185189094;9894.901050989398;9972.700818975298;9981.500924953723;10118.139958103497;10139.138173255356;17317.826821731873;17536.736948945778;17640.735388969177;17840.643187136444;17841.107944602718;7252.601106939169;7370.77887663371;7418.480706350611;7456.7390141344795;7459.8508029839095;3991.5409727881665;4149.605787450188;4150.771707556053;4151.667866570667;4212.241796476603;2819.6193513875774;2948.8083274587084;2949.1447480230922;2955.527115661484;2956.7782416318864;521.8251885618284;525.324957429701;527.022373497165;527.4698927577759;535.1704857470904;548.9752961116759;606.4360145065132;634.6002018728171;666.7699643622942;681.9454443644596;8929.24101451371;9043.68347107848;9201.263898888074;9251.398659087137;9525;639.9936000640027;645.9224893012774;655.0673429079043;657.1588366890388;673.619405036153;4302.204092242945;4331.826726930887;4340.848070317524;4351.760653164043;4449.9555004450185;70764;90134.54932725294;96343;98412.50793745986;99603.50198248963;83454.5827270872;83568.58215708882;83886.58056709677;84058.15941840626;84090;75111.24888751152;75371.62314188395;75591.24408755952;76082;77430.6128469354;7738.303552680286;8002;8035.598220089089;8177.632006559838;8185.345172386075;42520.78739606282;43634.781826090664;44125.77937110294;44540;45037.77481112573;55165.172522413;55696.16455753086;59519.40480595312;60716;62223.37776622176;10535.209859260432;10786.676399708022;10956.506957187104;11205.88794112081;11356.886431135914;13282.335883205995;13762.449502019806;13954.162750235018;14221.64445888861;14576.635584110481;13111.27887966133;13264.53574124901;13381.464741410624;13383.53157639478;13706.45174193061;12869.35653217354;12879.613611591667;13340.599782006555;13343.399547020214;13692.65768355799;12063.879361206627;12425.19236249641;12489.812652810397;12515.499380024698;12540.184887982252;10017.59929602837;10247.231457640855;10690.078109870161;10724.249302548747;10886.455677216265;11184.328940263611;11228.943855280999;11425.542978280775;11444.599439019927;11490.77018459643 12:27:19 INFO - PROCESS | 1728 | __end_tp_report 12:27:19 INFO - PROCESS | 1728 | __start_cc_report 12:27:19 INFO - PROCESS | 1728 | _x_x_mozilla_cycle_collect,2241 12:27:19 INFO - PROCESS | 1728 | __end_cc_report 12:27:19 INFO - PROCESS | 1728 | __startTimestamp1476473239440__endTimestamp 12:27:19 INFO - PROCESS | 1728 | 12:27:19 INFO - PROCESS | 1728 | ------- Summary: start ------- 12:27:19 INFO - PROCESS | 1728 | Number of tests: 6 12:27:19 INFO - PROCESS | 1728 | 12:27:19 INFO - PROCESS | 1728 | [#0] dojo.html Cycles:165 Average:4907.55 Median:5198.40 stddev:737.98 (14.2%) stddev-sans-first:706.45 12:27:19 INFO - PROCESS | 1728 | Values: 2093.7 2809.7 2830.4 2860.7 2862.5 5030.6 5058.7 5069.9 5074.3 5076.8 4828.6 5058.9 5072.0 5105.6 5162.7 4490.3 4532.9 4535.5 4553.6 4635.0 4478.4 4527.3 4555.2 4573.1 4612.0 397.0 4534.3 4559.1 4567.7 4591.3 4458.1 4470.0 4514.5 4521.6 4529.5 4472.5 4488.1 4523.8 4551.0 4585.9 5054.8 5058.0 5070.0 5085.7 5121.8 5141.0 5193.8 5197.8 5282.5 5304.7 5390.0 5406.4 5409.5 5413.9 5478.1 4790.5 4891.4 4972.8 4978.0 4988.7 5370.1 5399.2 5410.4 5465.3 5471.8 5195.1 5235.8 5248.6 5251.8 5269.1 5339.3 5346.6 5351.1 5351.3 5353.4 5299.4 5309.3 5312.0 5313.4 5334.2 5274.1 5303.5 5307.8 5314.8 5323.5 3594.9 3595.2 3604.9 3608.3 3611.5 3209.2 3226.7 3228.6 3292.3 3294.1 5012.4 5078.2 5086.9 5087.6 5152.3 5290.1 5300.7 5436.9 5453.6 5458.7 4891.8 5026.7 5038.6 5044.0 5049.8 4420.7 4470.0 4475.2 4483.9 4535.6 5407.6 5557.3 5571.7 5572.4 5631.2 5294.0 5317.7 5319.8 5322.8 5388.6 5479.9 5494.4 5508.8 5514.5 5524.8 5250.8 5262.1 5270.5 5283.7 5295.5 5277.4 5344.6 5346.3 5372.2 5386.1 5234.2 5244.4 5254.0 5259.2 5260.6 5179.7 5182.3 5205.9 5238.3 5248.4 5184.0 5198.4 5199.4 5201.4 5210.8 5240.1 5255.5 5257.9 5259.9 5263.0 5265.2 5294.5 5300.4 5308.4 5312.9 12:27:19 INFO - PROCESS | 1728 | 12:27:19 INFO - PROCESS | 1728 | [#1] ext.html Cycles:180 Average:46024.81 Median:34664.07 stddev:85179.64 (245.7%) stddev-sans-first:85350.11 12:27:19 INFO - PROCESS | 1728 | Values: 534.2 543.6 545.4 546.7 573.3 33301.0 36609.3 37105.8 37114.0 37168.5 36966.6 37338.6 37420.0 37431.8 37461.6 8280.2 8390.3 8424.9 8436.5 8438.8 8223.7 8244.3 8326.5 8329.7 8338.9 8360.0 8388.1 8391.3 8425.3 8428.1 8356.5 8372.3 8386.7 8390.5 8402.7 8368.5 8374.0 8434.2 8436.2 8451.2 34382.0 34631.8 34654.1 34674.0 34695.3 3011.5 3063.3 3073.2 3169.8 3308.6 28454.7 29032.9 29670.0 29802.9 29851.0 3695.7 3777.2 3790.1 3840.6 4089.3 275562.0 276469.0 277445.0 279382.0 279455.0 46002.5 46188.8 46661.0 46664.3 46676.8 29941.4 30763.0 30805.2 31843.0 32074.7 14348.7 14431.2 14432.9 14479.9 14490.6 10957.8 11019.7 11065.0 11081.9 11090.4 15742.9 15772.7 15788.4 15819.8 15940.6 6196.0 6212.6 6282.9 6285.1 6296.9 768.4 835.7 858.5 861.5 915.6 25395.7 25716.4 26643.1 26707.2 26777.3 916.3 922.5 926.4 928.7 970.3 13927.0 13938.4 13970.3 14066.8 14194.7 335929.0 336771.0 339743.0 340273.0 340393.0 44495.3 44890.0 44966.8 45006.8 45050.8 959.3 1062.2 1086.5 1086.6 1117.2 22717.5 27934.6 28585.3 29717.0 30596.7 44187.3 44735.6 44737.0 44811.6 44813.3 348349.0 350464.4 350676.0 350692.0 351013.0 21187.4 21388.4 21902.0 24023.8 24403.3 37179.6 38984.8 39405.0 40231.4 40582.6 33693.8 34215.3 34280.0 34538.7 34679.8 33976.0 34139.8 34144.3 34194.5 34719.1 27868.0 33156.7 33368.5 33615.7 34188.3 29949.9 31372.8 31372.8 31484.0 31539.8 23559.4 23780.9 23797.9 23822.6 24220.4 12:27:19 INFO - PROCESS | 1728 | 12:27:19 INFO - PROCESS | 1728 | [#2] jquery.html Cycles:180 Average:23493.03 Median:4672.80 stddev:64324.57 (1376.6%) stddev-sans-first:64481.46 12:27:19 INFO - PROCESS | 1728 | Values: 306.3 308.4 311.5 314.7 323.6 15778.2 16076.6 16894.2 16985.2 17044.7 15221.4 15655.0 15683.7 15877.3 15916.3 4725.2 4863.7 4867.2 4946.0 5240.5 5205.3 5274.1 5293.2 5296.9 5304.3 5059.9 5220.3 5232.1 5233.0 5250.9 5250.6 5288.2 5288.3 5291.0 5292.9 4439.1 4671.1 4674.5 4675.4 4692.5 10819.0 10846.5 10991.6 11001.1 11024.7 1880.5 1935.6 1954.3 2152.6 2432.9 8077.4 8100.5 8109.2 8181.1 11179.0 1716.3 1768.9 1784.0 1791.1 1804.6 68229.7 70425.6 70612.6 71462.6 74139.6 8308.7 8335.3 8369.6 8539.6 8563.2 10853.4 10870.3 10946.3 10949.8 10954.1 6651.8 6677.3 6725.2 6804.8 6818.2 6777.0 6777.3 6878.3 6883.6 6902.8 3411.7 3443.7 3478.6 3482.3 3492.0 1610.8 1639.7 1650.2 1653.5 1701.9 766.0 777.3 794.0 801.7 817.1 15822.0 16308.3 16439.4 16676.4 17090.6 792.6 826.3 849.5 851.9 893.5 8885.2 9244.6 9260.6 9315.1 9426.7 381699.0 386113.0 390386.0 393618.0 395566.0 53008.7 75257.0 76043.2 76131.0 76839.6 827.1 845.0 849.0 849.3 875.5 14620.0 14684.2 14691.9 14895.3 14940.2 33527.7 34873.7 36313.0 37992.4 38049.0 47774.3 48264.8 48531.0 48751.3 49116.5 6915.9 6997.2 7053.8 7332.3 7394.0 11194.6 11512.4 11984.9 12069.5 12396.1 10218.8 10270.8 10272.5 10286.1 10525.9 9818.5 10088.8 10357.6 10483.2 10522.9 10228.4 10259.6 10615.7 10653.6 10888.3 6867.4 7073.2 7126.4 7182.3 7399.8 7453.8 10035.6 10245.9 10250.5 10351.1 12:27:19 INFO - PROCESS | 1728 | 12:27:19 INFO - PROCESS | 1728 | [#3] mootools.html Cycles:180 Average:4558.96 Median:5890.75 stddev:2590.01 (44.0%) stddev-sans-first:2584.49 12:27:19 INFO - PROCESS | 1728 | Values: 1135.1 1165.7 1178.0 1242.5 1428.3 6420.1 6869.2 7082.2 7098.1 7232.5 7050.5 7097.2 7116.1 7121.9 7156.5 1922.5 1939.7 1947.6 1947.9 1949.0 1880.3 1905.9 1906.1 1910.8 1916.6 1884.2 1889.7 1893.3 1896.9 1897.5 1831.7 1885.7 1886.8 1888.5 1891.9 1770.2 1779.7 1782.8 1818.7 1875.4 7009.9 7097.1 7180.5 7233.5 7236.8 4064.9 4212.3 4220.6 4224.3 4232.4 2713.0 2778.2 2808.1 2819.6 2828.4 900.7 913.4 913.5 920.4 922.2 9693.3 9717.3 9767.8 9777.3 9779.3 3402.8 3497.3 3613.1 3622.4 3630.7 7622.8 7679.4 7697.6 7700.3 7706.0 4141.5 4154.4 4161.4 4180.4 4185.2 3510.0 3611.8 3962.1 3971.6 3980.9 2919.7 2999.0 3020.4 3031.8 3048.3 877.7 881.0 884.9 893.3 904.7 651.7 705.9 707.6 718.7 747.0 4453.5 4524.9 4636.4 4647.4 4647.7 786.3 794.7 796.8 800.4 820.5 2963.5 3109.1 3127.4 3148.7 3186.1 8016.4 8513.9 8515.1 8516.6 8546.4 8297.6 8439.0 8469.3 8483.3 8492.7 6378.9 6422.8 6424.7 6436.5 6459.2 4429.4 4438.5 4446.0 4480.6 4519.2 7518.1 7704.3 7726.3 7853.0 7855.0 7747.4 7937.1 7973.6 8030.2 8052.8 5884.3 5897.2 5907.7 5911.4 5947.5 6393.8 6498.5 7035.3 7059.5 7172.2 6488.5 6536.1 6546.6 6614.2 6639.2 6296.6 6323.9 6363.8 6401.7 6519.6 5670.9 5742.5 5753.5 5763.0 5791.8 3604.7 3613.1 3656.4 3665.9 3681.5 3746.9 3772.1 3841.5 3894.6 3928.6 12:27:19 INFO - PROCESS | 1728 | 12:27:19 INFO - PROCESS | 1728 | [#4] prototype.html Cycles:180 Average:4467.35 Median:5175.54 stddev:1417.34 (27.4%) stddev-sans-first:1385.59 12:27:19 INFO - PROCESS | 1728 | Values: 254.3 257.8 258.8 261.0 261.1 5075.1 5124.3 5134.3 5140.9 5145.3 5037.3 5056.8 5065.1 5068.2 5070.9 3643.5 3740.1 3751.3 3825.3 3837.8 3820.6 3821.2 3832.4 3832.4 3850.7 3818.8 3824.8 3833.0 3835.6 3839.9 3629.3 3703.6 3809.0 3854.8 3858.6 3208.2 3232.3 3248.0 3270.2 3278.2 4998.1 4998.3 5015.2 5026.4 5069.3 4087.2 4326.5 4379.0 4389.4 4400.4 5331.9 5359.2 5381.4 5386.2 5391.8 3509.2 3529.4 3534.8 3538.1 3540.6 5523.3 5634.0 5666.1 5706.9 5726.7 3519.9 3548.2 3558.4 3560.8 3562.2 3592.3 3607.6 3615.0 3620.2 3620.9 4302.7 4307.6 4315.5 4330.6 4339.8 5254.7 5362.9 5414.8 5424.8 5455.6 1232.2 1248.8 1254.1 1259.8 1267.2 747.8 760.0 770.6 778.4 782.3 4611.1 4974.7 5105.7 5138.3 5255.8 5570.2 5601.1 5614.4 5626.9 5636.9 5114.1 5220.7 5236.6 5257.3 5270.8 2946.7 2950.8 2968.4 2975.6 2984.7 5744.7 5753.8 5754.6 5761.3 5762.3 5419.7 5639.0 5687.2 5687.7 5718.0 5680.3 5718.4 5718.4 5731.9 5742.8 5581.7 5590.0 5598.7 5601.4 5603.6 5205.8 5505.7 5530.0 5536.5 5548.3 5821.6 5825.2 5836.8 5850.2 5863.5 3465.9 3541.9 3560.1 3562.3 3563.3 5599.6 5641.5 5647.1 5655.1 5662.4 5485.5 5496.7 5518.9 5520.1 5528.5 5354.2 5452.3 5480.0 5509.9 5528.6 5390.6 5439.2 5442.0 5453.7 5466.4 5264.8 5400.3 5416.0 5467.9 5510.5 5036.4 5311.9 5417.3 5485.5 5490.4 12:27:19 INFO - PROCESS | 1728 | 12:27:19 INFO - PROCESS | 1728 | [#5] yui.html Cycles:180 Average:18142.04 Median:44788.89 stddev:25264.58 (56.4%) stddev-sans-first:25301.16 12:27:19 INFO - PROCESS | 1728 | Values: 612.9 619.8 697.0 697.3 714.9 13362.2 13975.4 14057.6 14096.9 14157.4 14438.9 14538.3 14774.6 14775.5 14794.1 559.2 580.0 647.4 664.0 669.2 623.0 624.6 652.2 655.7 659.3 694.6 696.6 697.8 700.8 701.4 590.5 601.1 691.8 695.5 695.5 461.4 466.6 467.7 493.5 494.3 13249.7 13275.6 13297.8 13316.7 13318.4 11617.3 11830.3 11839.0 11996.1 12471.4 12379.0 12435.1 12436.4 12575.3 12603.1 4145.6 4164.6 4193.3 4257.1 4264.7 72163.0 72794.0 74487.6 75521.0 75629.6 9894.9 9972.7 9981.5 10118.1 10139.1 17317.8 17536.7 17640.7 17840.6 17841.1 7252.6 7370.8 7418.5 7456.7 7459.9 3991.5 4149.6 4150.8 4151.7 4212.2 2819.6 2948.8 2949.1 2955.5 2956.8 521.8 525.3 527.0 527.5 535.2 549.0 606.4 634.6 666.8 681.9 8929.2 9043.7 9201.3 9251.4 9525.0 640.0 645.9 655.1 657.2 673.6 4302.2 4331.8 4340.8 4351.8 4450.0 70764.0 90134.5 96343.0 98412.5 99603.5 83454.6 83568.6 83886.6 84058.2 84090.0 75111.2 75371.6 75591.2 76082.0 77430.6 7738.3 8002.0 8035.6 8177.6 8185.3 42520.8 43634.8 44125.8 44540.0 45037.8 55165.2 55696.2 59519.4 60716.0 62223.4 10535.2 10786.7 10956.5 11205.9 11356.9 13282.3 13762.4 13954.2 14221.6 14576.6 13111.3 13264.5 13381.5 13383.5 13706.5 12869.4 12879.6 13340.6 13343.4 13692.7 12063.9 12425.2 12489.8 12515.5 12540.2 10017.6 10247.2 10690.1 10724.2 10886.5 11184.3 11228.9 11425.5 11444.6 11490.8 12:27:19 INFO - PROCESS | 1728 | -------- Summary: end -------- 12:27:19 INFO - PROCESS | 1728 | 12:27:20 INFO - TEST-INFO | 1728: exit 0 12:27:20 INFO - TEST-OK | dromaeo_css | took 1121891ms 12:27:20 INFO - TEST-START | kraken 12:27:20 INFO - operating with platform_type : w8_ 12:27:20 INFO - Initialising browser for kraken test... 12:27:20 INFO - TEST-INFO | started process 2772 (C:\slave\test\build\application\firefox\firefox -profile c:\users\cltbld~1.t-w\appdata\local\temp\tmpgyyn8x\profile http://localhost:49270/getInfo.html) 12:27:26 INFO - PROCESS | 2772 | __metrics Screen width/height:1600/1200 12:27:26 INFO - PROCESS | 2772 | colorDepth:24 12:27:26 INFO - PROCESS | 2772 | Browser inner width/height: 1010/674 12:27:26 INFO - PROCESS | 2772 | __metrics 12:27:27 INFO - PROCESS | 2772 | JavaScript error: resource://gre/modules/AsyncShutdown.jsm, line 693: Error: Phase "quit-application-granted" is finished, it is too late to register completion condition "SessionStore: flushing all windows" 12:27:27 INFO - PROCESS | 2772 | JavaScript error: resource://app/modules/BrowserUsageTelemetry.jsm, line 181: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 12:27:27 INFO - PROCESS | 2772 | console.error: 12:27:27 INFO - PROCESS | 2772 | Message: Error: Connection closed before committing the transaction. 12:27:27 INFO - PROCESS | 2772 | Stack: 12:27:27 INFO - PROCESS | 2772 | ConnectionData.prototype<.executeTransaction/promise resource://gre/modules/Promise-backend.js:937:23 12:27:27 INFO - PROCESS | 2772 | this.PromiseWalker.walkerLoop@resource://gre/modules/Promise.jsm -> resource://gre/modules/Promise-backend.js:816:7 12:27:27 INFO - PROCESS | 2772 | Promise*this.PromiseWalker.scheduleWalkerLoop@resource://gre/modules/Promise.jsm -> resource://gre/modules/Promise-backend.js:747:11 12:27:27 INFO - PROCESS | 2772 | this.PromiseWalker.schedulePromise@resource://gre/modules/Promise.jsm -> resource://gre/modules/Promise-backend.js:779:7 12:27:27 INFO - PROCESS | 2772 | this.PromiseWalker.completePromise@resource://gre/modules/Promise.jsm -> resource://gre/modules/Promise-backend.js:714:7 12:27:27 INFO - PROCESS | 2772 | TaskImpl_run@resource://gre/modules/Task.jsm:327:15 12:27:27 INFO - PROCESS | 2772 | Spinner.prototype.observe@resource://gre/modules/AsyncShutdown.jsm:551:9 12:27:27 INFO - PROCESS | 2772 | nsAsyncShutdownClient.prototype.addBlocker/moduleBlocker/<@resource://gre/components/nsAsyncShutdown.js:157:15 12:27:27 INFO - PROCESS | 2772 | Promise@resource://gre/modules/Promise.jsm -> resource://gre/modules/Promise-backend.js:388:5 12:27:27 INFO - PROCESS | 2772 | nsAsyncShutdownClient.prototype.addBlocker/moduleBlocker@resource://gre/components/nsAsyncShutdown.js:153:29 12:27:27 INFO - PROCESS | 2772 | Barrier/this.client.addBlocker/promise13.4% 12:28:24 INFO - TinderboxPrint: I/O read bytes / time
282,501,632 / 2,351,770 12:28:24 INFO - TinderboxPrint: I/O write bytes / time
411,212,288 / 3,988,770 12:28:24 INFO - TinderboxPrint: CPU idle
8,237.0 (86.6%) 12:28:24 INFO - TinderboxPrint: CPU user
1,224.6 (12.9%) 12:28:24 INFO - install - Wall time: 3s; CPU: 11.0%; Read bytes: 0; Write bytes: 38770176; Read time: 0; Write time: 81030 12:28:24 INFO - run-tests - Wall time: 1187s; CPU: 13.0%; Read bytes: 282501632; Write bytes: 315913216; Read time: 2351770; Write time: 3860770 12:28:25 INFO - Running post-run listener: _upload_blobber_files 12:28:25 INFO - Blob upload gear active. 12:28:25 INFO - Preparing to upload files from C:\slave\test\build\blobber_upload_dir. 12:28:25 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 12:28:25 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', 'Autoland', '-d', 'C:\\slave\\test\\build\\blobber_upload_dir', '--output-manifest', 'C:\\slave\\test\\build\\uploaded_files.json'] 12:28:25 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 Autoland -d C:\slave\test\build\blobber_upload_dir --output-manifest C:\slave\test\build\uploaded_files.json 12:28:25 INFO - (blobuploader) - INFO - Open directory for files ... 12:28:25 INFO - (blobuploader) - INFO - Uploading C:\slave\test\build\blobber_upload_dir\dromaeojs_errorsummary.log ... 12:28:25 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 12:28:25 INFO - (blobuploader) - INFO - Uploading, attempt #1. 12:28:26 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_errorsummary.log: uploaded 12:28:26 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 12:28:26 INFO - (blobuploader) - INFO - Done attempting. 12:28:26 INFO - (blobuploader) - INFO - Uploading C:\slave\test\build\blobber_upload_dir\dromaeojs_raw.log ... 12:28:26 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 12:28:26 INFO - (blobuploader) - INFO - Uploading, attempt #1. 12:28:27 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_raw.log: uploaded 12:28:27 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 12:28:27 INFO - (blobuploader) - INFO - Done attempting. 12:28:27 INFO - (blobuploader) - INFO - Uploading C:\slave\test\build\blobber_upload_dir\resource-usage.json ... 12:28:27 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 12:28:27 INFO - (blobuploader) - INFO - Uploading, attempt #1. 12:28:29 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 12:28:29 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 12:28:29 INFO - (blobuploader) - INFO - Done attempting. 12:28:29 INFO - (blobuploader) - INFO - Iteration through files over. 12:28:29 INFO - Return code: 0 12:28:29 INFO - rmtree: C:\slave\test\build\uploaded_files.json 12:28:29 INFO - Using _rmtree_windows ... 12:28:29 INFO - retry: Calling _rmtree_windows with args: ('C:\\slave\\test\\build\\uploaded_files.json',), kwargs: {}, attempt #1 12:28:29 INFO - Setting buildbot property blobber_files to {"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland/sha512/d651fc21fb0a98d61426f9c85fbf28941b7a33f57975e03443cb79ab6adbaa28f245922b1c17b2536be6386cdf88c620b9b737b04e57a27657f1c2e2b17a52b9", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland/sha512/7e27e70cfba011ba0552347aceafed69e1d33e2693508ff849d5c0844b9687b9cb19226fabc6a828087dd9cb24d664a43bfe6583be793dcbfc0f33bc5d678e09", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland/sha512/8cdc81251ea46a5443a6207d66665eb8cebd25657f0d7f6c5d8bcb8dffe5e855895e23dda9e15e3cb078d116d272111357065614198a2774a322188094ca1894"} 12:28:29 INFO - Writing buildbot properties ['blobber_files'] to C:\slave\test\properties\blobber_files 12:28:29 INFO - Writing to file C:\slave\test\properties\blobber_files 12:28:29 INFO - Contents: 12:28:29 INFO - blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland/sha512/d651fc21fb0a98d61426f9c85fbf28941b7a33f57975e03443cb79ab6adbaa28f245922b1c17b2536be6386cdf88c620b9b737b04e57a27657f1c2e2b17a52b9", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland/sha512/7e27e70cfba011ba0552347aceafed69e1d33e2693508ff849d5c0844b9687b9cb19226fabc6a828087dd9cb24d664a43bfe6583be793dcbfc0f33bc5d678e09", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland/sha512/8cdc81251ea46a5443a6207d66665eb8cebd25657f0d7f6c5d8bcb8dffe5e855895e23dda9e15e3cb078d116d272111357065614198a2774a322188094ca1894"} 12:28:29 INFO - Running post-run listener: copy_logs_to_upload_dir 12:28:29 INFO - Copying logs to upload dir... 12:28:29 INFO - mkdir: C:\slave\test\build\upload\logs 12:28:29 INFO - Copying logs to upload dir... 12:28:29 INFO - Using _rmtree_windows ... 12:28:29 INFO - Using _rmtree_windows ... 12:28:29 INFO - Using _rmtree_windows ... 12:28:29 INFO - Using _rmtree_windows ... 12:28:29 INFO - Using _rmtree_windows ... 12:28:29 INFO - Using _rmtree_windows ... 12:28:29 INFO - Using _rmtree_windows ... program finished with exit code 0 elapsedTime=1375.873000 ========= master_lag: 1.98 ========= ========= Finished 'c:/mozilla-build/python27/python -u ...' (results: 0, elapsed: 22 mins, 57 secs) (at 2016-10-14 12:28:31.959444) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-10-14 12:28:31.965978) ========= '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-059\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-059 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-059 KTS_HOME=C:\Program Files\KTS KTS_VERSION=1.19c LOCALAPPDATA=C:\Users\cltbld.T-W864-IX-059\AppData\Local LOGONSERVER=\\T-W864-IX-059 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-059 USERDOMAIN_ROAMINGPROFILE=T-W864-IX-059 USERNAME=cltbld USERPROFILE=C:\Users\cltbld.T-W864-IX-059 WINDIR=C:\windows XPCOM_DEBUG_BREAK=warn using PTY: False blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland/sha512/d651fc21fb0a98d61426f9c85fbf28941b7a33f57975e03443cb79ab6adbaa28f245922b1c17b2536be6386cdf88c620b9b737b04e57a27657f1c2e2b17a52b9", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland/sha512/7e27e70cfba011ba0552347aceafed69e1d33e2693508ff849d5c0844b9687b9cb19226fabc6a828087dd9cb24d664a43bfe6583be793dcbfc0f33bc5d678e09", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland/sha512/8cdc81251ea46a5443a6207d66665eb8cebd25657f0d7f6c5d8bcb8dffe5e855895e23dda9e15e3cb078d116d272111357065614198a2774a322188094ca1894"} build_url:https://queue.taskcluster.net/v1/task/Tfvx-uL5Sl2RNwD0xeruXg/artifacts/public/build/firefox-52.0a1.en-US.win64.zip program finished with exit code 0 elapsedTime=0.101000 build_url: 'https://queue.taskcluster.net/v1/task/Tfvx-uL5Sl2RNwD0xeruXg/artifacts/public/build/firefox-52.0a1.en-US.win64.zip' blobber_files: '{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland/sha512/d651fc21fb0a98d61426f9c85fbf28941b7a33f57975e03443cb79ab6adbaa28f245922b1c17b2536be6386cdf88c620b9b737b04e57a27657f1c2e2b17a52b9", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland/sha512/7e27e70cfba011ba0552347aceafed69e1d33e2693508ff849d5c0844b9687b9cb19226fabc6a828087dd9cb24d664a43bfe6583be793dcbfc0f33bc5d678e09", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland/sha512/8cdc81251ea46a5443a6207d66665eb8cebd25657f0d7f6c5d8bcb8dffe5e855895e23dda9e15e3cb078d116d272111357065614198a2774a322188094ca1894"}' ========= master_lag: 0.02 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-10-14 12:28:32.089463) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-10-14 12:28:32.089864) ========= '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-059\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-059 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-059 KTS_HOME=C:\Program Files\KTS KTS_VERSION=1.19c LOCALAPPDATA=C:\Users\cltbld.T-W864-IX-059\AppData\Local LOGONSERVER=\\T-W864-IX-059 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-059 USERDOMAIN_ROAMINGPROFILE=T-W864-IX-059 USERNAME=cltbld USERPROFILE=C:\Users\cltbld.T-W864-IX-059 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-10-14 12:28:32.209205) ========= ========= Started reboot slave lost (results: 0, elapsed: 0 secs) (at 2016-10-14 12:28:32.209539) ========= ========= Finished reboot slave lost (results: 0, elapsed: 0 secs) (at 2016-10-14 12:28:32.644871) ========= ========= Total master_lag: 2.15 =========