builder: autoland_win8_64_test-dromaeojs-pgo
slave: t-w864-ix-042
starttime: 1478645075.94
results: success (0)
buildid: 20161108123001
builduid: 72158b1550fd4a8abda9a091b5ead976
revision: d0a3a42979e805db3b896ca786ed61ba85d9a6a7
========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-11-08 14:44:35.940499) =========
master: http://buildbot-master110.bb.releng.scl3.mozilla.com:8201/
========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-11-08 14:44:35.940984) =========
========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-11-08 14:44:35.941261) =========
========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-11-08 14:44:36.538684) =========
========= Started 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2016-11-08 14:44:36.539151) =========
'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-042\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-042
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-042
KTS_HOME=C:\Program Files\KTS
KTS_VERSION=1.19c
LOCALAPPDATA=C:\Users\cltbld.T-W864-IX-042\AppData\Local
LOGONSERVER=\\T-W864-IX-042
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-042
USERDOMAIN_ROAMINGPROFILE=T-W864-IX-042
USERNAME=cltbld
USERPROFILE=C:\Users\cltbld.T-W864-IX-042
WINDIR=C:\windows
XPCOM_DEBUG_BREAK=warn
using PTY: False
--14:44:37-- 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% 2.11 GB/s
14:44:37 (2.11 GB/s) - `archiver_client.py' saved [12179/12179]
program finished with exit code 0
elapsedTime=1.608000
========= master_lag: 0.05 =========
========= Finished 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2016-11-08 14:44:38.198631) =========
========= Started 'rm -rf ...' (results: 0, elapsed: 3 secs) (at 2016-11-08 14:44:38.198980) =========
'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-042\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-042
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-042
KTS_HOME=C:\Program Files\KTS
KTS_VERSION=1.19c
LOCALAPPDATA=C:\Users\cltbld.T-W864-IX-042\AppData\Local
LOGONSERVER=\\T-W864-IX-042
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-042
USERDOMAIN_ROAMINGPROFILE=T-W864-IX-042
USERNAME=cltbld
USERPROFILE=C:\Users\cltbld.T-W864-IX-042
WINDIR=C:\windows
XPCOM_DEBUG_BREAK=warn
using PTY: False
program finished with exit code 0
elapsedTime=3.911000
========= master_lag: 0.02 =========
========= Finished 'rm -rf ...' (results: 0, elapsed: 3 secs) (at 2016-11-08 14:44:42.127359) =========
========= Started 'bash -c ...' (results: 0, elapsed: 2 secs) (at 2016-11-08 14:44:42.127792) =========
'bash' '-c' u'python archiver_client.py mozharness --repo integration/autoland --rev d0a3a42979e805db3b896ca786ed61ba85d9a6a7 --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 d0a3a42979e805db3b896ca786ed61ba85d9a6a7 --destination scripts --debug']
environment:
ALLUSERSPROFILE=C:\ProgramData
APPDATA=C:\Users\cltbld.T-W864-IX-042\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-042
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-042
KTS_HOME=C:\Program Files\KTS
KTS_VERSION=1.19c
LOCALAPPDATA=C:\Users\cltbld.T-W864-IX-042\AppData\Local
LOGONSERVER=\\T-W864-IX-042
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-042
USERDOMAIN_ROAMINGPROFILE=T-W864-IX-042
USERNAME=cltbld
USERPROFILE=C:\Users\cltbld.T-W864-IX-042
WINDIR=C:\windows
XPCOM_DEBUG_BREAK=warn
using PTY: False
2016-11-08 14:44:42,213 truncating revision to first 12 chars
2016-11-08 14:44:42,213 Setting DEBUG logging.
2016-11-08 14:44:42,213 attempt 1/10
2016-11-08 14:44:42,213 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/integration/autoland/d0a3a42979e8?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness
2016-11-08 14:44:43,398 unpacking tar archive at: autoland-d0a3a42979e8/testing/mozharness/
2016-11-08 14:44:43,503 skipping symlink on windows: configs/single_locale/linux32.py
program finished with exit code 0
elapsedTime=2.034000
========= master_lag: 0.11 =========
========= Finished 'bash -c ...' (results: 0, elapsed: 2 secs) (at 2016-11-08 14:44:44.272968) =========
========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-11-08 14:44:44.273245) =========
script_repo_revision: d0a3a42979e805db3b896ca786ed61ba85d9a6a7
========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-11-08 14:44:44.273623) =========
========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-11-08 14:44:44.279362) =========
========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-11-08 14:44:44.301573) =========
========= Started 'c:/mozilla-build/python27/python -u ...' (results: 0, elapsed: 23 mins, 11 secs) (at 2016-11-08 14:44:44.301878) =========
'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-042\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-042
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-042
KTS_HOME=C:\Program Files\KTS
KTS_VERSION=1.19c
LOCALAPPDATA=C:\Users\cltbld.T-W864-IX-042\AppData\Local
LOGONSERVER=\\T-W864-IX-042
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-042
USERDOMAIN_ROAMINGPROFILE=T-W864-IX-042
USERNAME=cltbld
USERPROFILE=C:\Users\cltbld.T-W864-IX-042
WINDIR=C:\windows
XPCOM_DEBUG_BREAK=warn
using PTY: False
14:44:44 INFO - MultiFileLogger online at 20161108 14:44:44 in C:\slave\test
14:44:44 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
14:44:44 INFO - Dumping config to C:\slave\test\logs\localconfig.json.
14:44:44 INFO - {'append_to_log': False,
14:44:44 INFO - 'base_work_dir': 'C:\\slave\\test',
14:44:44 INFO - 'blob_upload_branch': 'Autoland',
14:44:44 INFO - 'blob_uploader_auth_file': 'C:\\slave\\test\\oauth.txt',
14:44:44 INFO - 'branch': 'Autoland',
14:44:44 INFO - 'buildbot_json_path': 'buildprops.json',
14:44:44 INFO - 'config_files': ('talos/windows_config.py',),
14:44:44 INFO - 'default_actions': ('clobber',
14:44:44 INFO - 'read-buildbot-config',
14:44:44 INFO - 'download-and-extract',
14:44:44 INFO - 'populate-webroot',
14:44:44 INFO - 'create-virtualenv',
14:44:44 INFO - 'install',
14:44:44 INFO - 'run-tests'),
14:44:44 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',),
14:44:44 INFO - 'download_minidump_stackwalk': True,
14:44:44 INFO - 'download_symbols': 'ondemand',
14:44:44 INFO - 'exes': {'easy_install': ('C:\\slave\\test\\build/venv/scripts/python',
14:44:44 INFO - 'C:\\slave\\test\\build/venv/scripts/easy_install-2.7-script.py'),
14:44:44 INFO - 'hg': 'c:/mozilla-build/hg/hg',
14:44:44 INFO - 'mozinstall': ('C:\\slave\\test\\build/venv/scripts/python',
14:44:44 INFO - 'C:\\slave\\test\\build/venv/scripts/mozinstall-script.py'),
14:44:44 INFO - 'python': 'c:/mozilla-build/python27/python.exe',
14:44:44 INFO - 'tooltool.py': ('c:/mozilla-build/python27/python.exe',
14:44:44 INFO - 'C:/mozilla-build/tooltool.py'),
14:44:44 INFO - 'virtualenv': ('c:/mozilla-build/python27/python.exe',
14:44:44 INFO - 'c:/mozilla-build/buildbotve/virtualenv.py')},
14:44:44 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub',
14:44:44 INFO - 'http://pypi.pub.build.mozilla.org/pub'),
14:44:44 INFO - 'installer_path': 'installer.exe',
14:44:44 INFO - 'log_level': 'info',
14:44:44 INFO - 'log_name': 'talos',
14:44:44 INFO - 'log_to_console': True,
14:44:44 INFO - 'metro_harness_path_frmt': '%(metro_base_path)s/metro/metrotestharness.exe',
14:44:44 INFO - 'minidump_stackwalk_path': 'win32-minidump_stackwalk.exe',
14:44:44 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/win32/releng.manifest',
14:44:44 INFO - 'opt_config_files': (),
14:44:44 INFO - 'pip_index': False,
14:44:44 INFO - 'sps_profile': False,
14:44:44 INFO - 'sps_profile_interval': 0,
14:44:44 INFO - 'suite': 'dromaeojs',
14:44:44 INFO - 'system_bits': '32',
14:44:44 INFO - 'talos_extra_options': ('--webServer', 'localhost'),
14:44:44 INFO - 'title': 'T-W864-IX-042',
14:44:44 INFO - 'use_talos_json': True,
14:44:44 INFO - 'virtualenv_modules': ('pywin32', 'talos', 'mozinstall'),
14:44:44 INFO - 'virtualenv_path': 'C:\\slave\\test\\build/venv',
14:44:44 INFO - 'virtualenv_python_dll': 'c:/mozilla-build/python27/python27.dll',
14:44:44 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None},
14:44:44 INFO - 'work_dir': 'build'}
14:44:44 INFO - [mozharness: 2016-11-08 22:44:44.506000Z] Running clobber step.
14:44:44 INFO - Running pre-action listener: _resource_record_pre_action
14:44:44 INFO - Running main action method: clobber
14:44:44 INFO - rmtree: C:\slave\test\build
14:44:44 INFO - Using _rmtree_windows ...
14:44:44 INFO - retry: Calling _rmtree_windows with args: ('C:\\slave\\test\\build',), kwargs: {}, attempt #1
14:46:21 INFO - Running post-action listener: _resource_record_post_action
14:46:21 INFO - [mozharness: 2016-11-08 22:46:21.423000Z] Finished clobber step (success)
14:46:21 INFO - [mozharness: 2016-11-08 22:46:21.423000Z] Running read-buildbot-config step.
14:46:21 INFO - Running pre-action listener: _resource_record_pre_action
14:46:21 INFO - Running main action method: read_buildbot_config
14:46:21 INFO - Using buildbot properties:
14:46:21 INFO - {
14:46:21 INFO - "project": "",
14:46:21 INFO - "product": "firefox",
14:46:21 INFO - "script_repo_revision": "production",
14:46:21 INFO - "builddir": "autoland_win8_64_test-dromaeojs",
14:46:21 INFO - "repository": "",
14:46:21 INFO - "buildername": "Windows 8 64-bit autoland pgo talos dromaeojs",
14:46:21 INFO - "buildid": "20161108123001",
14:46:21 INFO - "pgo_build": "True",
14:46:21 INFO - "basedir": "C:\\slave\\test",
14:46:21 INFO - "buildnumber": 53,
14:46:21 INFO - "slavename": "t-w864-ix-042",
14:46:21 INFO - "master": "http://buildbot-master110.bb.releng.scl3.mozilla.com:8201/",
14:46:21 INFO - "platform": "win8_64",
14:46:21 INFO - "scheduler": "tests-autoland-win64-pgo-talos",
14:46:21 INFO - "branch": "autoland",
14:46:21 INFO - "repo_path": "integration/autoland",
14:46:21 INFO - "revision": "d0a3a42979e805db3b896ca786ed61ba85d9a6a7",
14:46:21 INFO - "stage_platform": "win64-pgo",
14:46:21 INFO - "builduid": "72158b1550fd4a8abda9a091b5ead976",
14:46:21 INFO - "slavebuilddir": "test"
14:46:21 INFO - }
14:46:21 INFO - Found installer url https://queue.taskcluster.net/v1/task/KNtoCvDQSSq0GlhL-_0P1A/artifacts/public/build/firefox-52.0a1.en-US.win64.zip.
14:46:21 INFO - Running post-action listener: _resource_record_post_action
14:46:21 INFO - [mozharness: 2016-11-08 22:46:21.426000Z] Finished read-buildbot-config step (success)
14:46:21 INFO - [mozharness: 2016-11-08 22:46:21.426000Z] Running download-and-extract step.
14:46:21 INFO - Running pre-action listener: _resource_record_pre_action
14:46:21 INFO - Running main action method: download_and_extract
14:46:21 INFO - mkdir: C:\slave\test\build\tests
14:46:21 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')]}
14:46:21 INFO - trying https://queue.taskcluster.net/v1/task/KNtoCvDQSSq0GlhL-_0P1A/artifacts/public/build/firefox-52.0a1.en-US.win64.test_packages.json
14:46:21 INFO - Downloading https://queue.taskcluster.net/v1/task/KNtoCvDQSSq0GlhL-_0P1A/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
14:46:21 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/KNtoCvDQSSq0GlhL-_0P1A/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
14:46:22 INFO - Downloaded 1218 bytes.
14:46:22 INFO - Reading from file C:\slave\test\build\firefox-52.0a1.en-US.win64.test_packages.json
14:46:22 INFO - Using the following test package requirements:
14:46:22 INFO - {u'common': [u'firefox-52.0a1.en-US.win64.common.tests.zip'],
14:46:22 INFO - u'cppunittest': [u'firefox-52.0a1.en-US.win64.common.tests.zip',
14:46:22 INFO - u'firefox-52.0a1.en-US.win64.cppunittest.tests.zip'],
14:46:22 INFO - u'gtest': [u'firefox-52.0a1.en-US.win64.common.tests.zip'],
14:46:22 INFO - u'jittest': [u'firefox-52.0a1.en-US.win64.common.tests.zip',
14:46:22 INFO - u'jsshell-win64.zip'],
14:46:22 INFO - u'mochitest': [u'firefox-52.0a1.en-US.win64.common.tests.zip',
14:46:22 INFO - u'firefox-52.0a1.en-US.win64.mochitest.tests.zip'],
14:46:22 INFO - u'mozbase': [u'firefox-52.0a1.en-US.win64.common.tests.zip'],
14:46:22 INFO - u'reftest': [u'firefox-52.0a1.en-US.win64.common.tests.zip',
14:46:22 INFO - u'firefox-52.0a1.en-US.win64.reftest.tests.zip'],
14:46:22 INFO - u'talos': [u'firefox-52.0a1.en-US.win64.common.tests.zip',
14:46:22 INFO - u'firefox-52.0a1.en-US.win64.talos.tests.zip'],
14:46:22 INFO - u'web-platform': [u'firefox-52.0a1.en-US.win64.common.tests.zip',
14:46:22 INFO - u'firefox-52.0a1.en-US.win64.web-platform.tests.zip'],
14:46:22 INFO - u'xpcshell': [u'firefox-52.0a1.en-US.win64.common.tests.zip',
14:46:22 INFO - u'firefox-52.0a1.en-US.win64.xpcshell.tests.zip']}
14:46:22 INFO - Downloading packages: [u'firefox-52.0a1.en-US.win64.common.tests.zip'] for test suite category: common
14:46:22 INFO - Downloading and extracting to C:\slave\test\build\tests these dirs * from https://queue.taskcluster.net/v1/task/KNtoCvDQSSq0GlhL-_0P1A/artifacts/public/build/firefox-52.0a1.en-US.win64.common.tests.zip
14:46:22 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/KNtoCvDQSSq0GlhL-_0P1A/artifacts/public/build/firefox-52.0a1.en-US.win64.common.tests.zip'}, attempt #1
14:46:22 INFO - Fetch https://queue.taskcluster.net/v1/task/KNtoCvDQSSq0GlhL-_0P1A/artifacts/public/build/firefox-52.0a1.en-US.win64.common.tests.zip into memory
14:46:22 INFO - Http code: 200
14:46:22 INFO - via: 1.1 0302e8c462515ae281b72d9c815a5698.cloudfront.net (CloudFront)
14:46:22 INFO - x-amz-cf-id: hSaTyPa38DYRnASV2wQZhuAuVuDt3-aL5glDO_-ObQwMjCWgYaTJ3g==
14:46:22 INFO - x-amz-version-id: ZOlbGqWAQTZn7qaWYUiSFpzNnvnTlCGa
14:46:23 INFO - Expected file size: 17355239
14:46:23 INFO - Obtained file size: 17355239
14:46:44 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
14:46:44 INFO - Downloading and extracting to C:\slave\test\build\tests these dirs * from https://queue.taskcluster.net/v1/task/KNtoCvDQSSq0GlhL-_0P1A/artifacts/public/build/firefox-52.0a1.en-US.win64.common.tests.zip
14:46:44 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/KNtoCvDQSSq0GlhL-_0P1A/artifacts/public/build/firefox-52.0a1.en-US.win64.common.tests.zip'}, attempt #1
14:46:44 INFO - Fetch https://queue.taskcluster.net/v1/task/KNtoCvDQSSq0GlhL-_0P1A/artifacts/public/build/firefox-52.0a1.en-US.win64.common.tests.zip into memory
14:46:44 INFO - Http code: 200
14:46:44 INFO - via: 1.1 423912f2b1c5569e2fa5017167c61fa0.cloudfront.net (CloudFront)
14:46:44 INFO - x-amz-cf-id: 0Jpj-FcqsdN2n8FkLd6XTH4cbijxdEqgcfV_DidKKfrIFejTd8PXKg==
14:46:44 INFO - x-amz-version-id: ZOlbGqWAQTZn7qaWYUiSFpzNnvnTlCGa
14:46:44 INFO - Expected file size: 17355239
14:46:44 INFO - Obtained file size: 17355239
14:46:54 INFO - Downloading and extracting to C:\slave\test\build\tests these dirs * from https://queue.taskcluster.net/v1/task/KNtoCvDQSSq0GlhL-_0P1A/artifacts/public/build/firefox-52.0a1.en-US.win64.talos.tests.zip
14:46:54 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/KNtoCvDQSSq0GlhL-_0P1A/artifacts/public/build/firefox-52.0a1.en-US.win64.talos.tests.zip'}, attempt #1
14:46:54 INFO - Fetch https://queue.taskcluster.net/v1/task/KNtoCvDQSSq0GlhL-_0P1A/artifacts/public/build/firefox-52.0a1.en-US.win64.talos.tests.zip into memory
14:46:55 INFO - Http code: 200
14:46:55 INFO - via: 1.1 423912f2b1c5569e2fa5017167c61fa0.cloudfront.net (CloudFront)
14:46:55 INFO - x-amz-cf-id: XgOzjLb2HDtIQfsgyVtbEWkC3UOc_oetibKYXvqVJyWwHpgv1oQgXg==
14:46:55 INFO - x-amz-version-id: nMFI974PCIFnspmKQQtSOkZRR4T3nrsd
14:46:55 INFO - Expected file size: 14409038
14:46:55 INFO - Obtained file size: 14409038
14:47:04 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')]}
14:47:04 INFO - trying https://queue.taskcluster.net/v1/task/KNtoCvDQSSq0GlhL-_0P1A/artifacts/public/build/firefox-52.0a1.en-US.win64.zip
14:47:04 INFO - Downloading https://queue.taskcluster.net/v1/task/KNtoCvDQSSq0GlhL-_0P1A/artifacts/public/build/firefox-52.0a1.en-US.win64.zip to C:\slave\test\build\firefox-52.0a1.en-US.win64.zip
14:47:04 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/KNtoCvDQSSq0GlhL-_0P1A/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
14:47:05 INFO - Downloaded 57408109 bytes.
14:47:05 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/KNtoCvDQSSq0GlhL-_0P1A/artifacts/public/build/firefox-52.0a1.en-US.win64.zip
14:47:05 INFO - mkdir: C:\slave\test\properties
14:47:05 INFO - Writing buildbot properties ['build_url'] to C:\slave\test\properties\build_url
14:47:05 INFO - Writing to file C:\slave\test\properties\build_url
14:47:05 INFO - Contents:
14:47:05 INFO - build_url:https://queue.taskcluster.net/v1/task/KNtoCvDQSSq0GlhL-_0P1A/artifacts/public/build/firefox-52.0a1.en-US.win64.zip
14:47:06 INFO - Running post-action listener: _resource_record_post_action
14:47:06 INFO - Running post-action listener: set_extra_try_arguments
14:47:06 INFO - [mozharness: 2016-11-08 22:47:06.395000Z] Finished download-and-extract step (success)
14:47:06 INFO - [mozharness: 2016-11-08 22:47:06.395000Z] Running populate-webroot step.
14:47:06 INFO - Running pre-action listener: _resource_record_pre_action
14:47:06 INFO - Running main action method: populate_webroot
14:47:06 INFO - {u'extra_options': {u'android': [u'--apkPath=%(apk_path)s']},
14:47:06 INFO - u'mobile-suites': {u'remote-tp4m_nochrome': {u'tests': [u'tp4m']},
14:47:06 INFO - u'remote-tsvgx': {u'talos_options': [u'--noChrome',
14:47:06 INFO - u'--tppagecycles',
14:47:06 INFO - u'7'],
14:47:06 INFO - u'tests': [u'tsvgm']}},
14:47:06 INFO - u'suites': {u'chromez': {u'talos_options': [u'--disable-e10s'],
14:47:06 INFO - u'tests': [u'tresize', u'tcanvasmark']},
14:47:06 INFO - u'chromez-e10s': {u'tests': [u'tresize', u'tcanvasmark']},
14:47:06 INFO - u'dromaeojs': {u'talos_options': [u'--disable-e10s'],
14:47:06 INFO - u'tests': [u'dromaeo_css', u'kraken']},
14:47:06 INFO - u'dromaeojs-e10s': {u'tests': [u'dromaeo_css', u'kraken']},
14:47:06 INFO - u'g1': {u'pagesets_url': u'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip',
14:47:06 INFO - u'talos_options': [u'--disable-e10s'],
14:47:06 INFO - u'tests': [u'tp5o_scroll', u'glterrain']},
14:47:06 INFO - u'g1-e10s': {u'pagesets_url': u'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip',
14:47:06 INFO - u'tests': [u'tp5o_scroll', u'glterrain']},
14:47:06 INFO - u'g2': {u'pagesets_url': u'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip',
14:47:06 INFO - u'talos_options': [u'--disable-e10s'],
14:47:06 INFO - u'tests': [u'damp', u'tps']},
14:47:06 INFO - u'g2-e10s': {u'pagesets_url': u'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip',
14:47:06 INFO - u'tests': [u'damp', u'tps']},
14:47:06 INFO - u'g3': {u'talos_options': [u'--disable-e10s'],
14:47:06 INFO - u'tests': [u'dromaeo_dom']},
14:47:06 INFO - u'g3-e10s': {u'tests': [u'dromaeo_dom']},
14:47:06 INFO - u'g4': {u'talos_options': [u'--disable-e10s'],
14:47:06 INFO - u'tests': [u'basic_compositor_video']},
14:47:06 INFO - u'g4-e10s': {u'tests': [u'basic_compositor_video']},
14:47:06 INFO - u'other': {u'talos_options': [u'--disable-e10s'],
14:47:06 INFO - u'tests': [u'a11yr',
14:47:06 INFO - u'ts_paint',
14:47:06 INFO - u'tpaint',
14:47:06 INFO - u'sessionrestore',
14:47:06 INFO - u'sessionrestore_no_auto_restore',
14:47:06 INFO - u'tabpaint']},
14:47:06 INFO - u'other-e10s': {u'tests': [u'a11yr',
14:47:06 INFO - u'ts_paint',
14:47:06 INFO - u'tpaint',
14:47:06 INFO - u'sessionrestore',
14:47:06 INFO - u'sessionrestore_no_auto_restore',
14:47:06 INFO - u'tabpaint']},
14:47:06 INFO - u'other-e10s_l64': {u'tests': [u'a11yr',
14:47:06 INFO - u'ts_paint',
14:47:06 INFO - u'tpaint',
14:47:06 INFO - u'sessionrestore',
14:47:06 INFO - u'sessionrestore_no_auto_restore',
14:47:06 INFO - u'tabpaint']},
14:47:06 INFO - u'other-e10s_nol64': {u'tests': [u'a11yr',
14:47:06 INFO - u'ts_paint',
14:47:06 INFO - u'tpaint',
14:47:06 INFO - u'sessionrestore',
14:47:06 INFO - u'sessionrestore_no_auto_restore',
14:47:06 INFO - u'tabpaint']},
14:47:06 INFO - u'other_l64': {u'talos_options': [u'--disable-e10s'],
14:47:06 INFO - u'tests': [u'a11yr',
14:47:06 INFO - u'ts_paint',
14:47:06 INFO - u'tpaint',
14:47:06 INFO - u'sessionrestore',
14:47:06 INFO - u'sessionrestore_no_auto_restore',
14:47:06 INFO - u'tabpaint']},
14:47:06 INFO - u'other_nol64': {u'talos_options': [u'--disable-e10s'],
14:47:06 INFO - u'tests': [u'a11yr',
14:47:06 INFO - u'ts_paint',
14:47:06 INFO - u'tpaint',
14:47:06 INFO - u'sessionrestore',
14:47:06 INFO - u'sessionrestore_no_auto_restore',
14:47:06 INFO - u'tabpaint']},
14:47:06 INFO - u'svgr': {u'talos_options': [u'--disable-e10s'],
14:47:06 INFO - u'tests': [u'tsvgx',
14:47:06 INFO - u'tsvgr_opacity',
14:47:06 INFO - u'tart',
14:47:06 INFO - u'tscrollx',
14:47:06 INFO - u'cart']},
14:47:06 INFO - u'svgr-e10s': {u'tests': [u'tsvgx',
14:47:06 INFO - u'tsvgr_opacity',
14:47:06 INFO - u'tart',
14:47:06 INFO - u'tscrollx',
14:47:06 INFO - u'cart']},
14:47:06 INFO - u'tp5o': {u'pagesets_url': u'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip',
14:47:06 INFO - u'talos_options': [u'--disable-e10s'],
14:47:06 INFO - u'tests': [u'tp5o']},
14:47:06 INFO - u'tp5o-e10s': {u'pagesets_url': u'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip',
14:47:06 INFO - u'tests': [u'tp5o']},
14:47:06 INFO - u'xperf': {u'pagesets_url': u'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip',
14:47:06 INFO - u'talos_options': [u'--disable-e10s',
14:47:06 INFO - u'--xperf_path',
14:47:06 INFO - u'"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'],
14:47:06 INFO - u'tests': [u'tp5n']},
14:47:06 INFO - u'xperf-e10s': {u'pagesets_url': u'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip',
14:47:06 INFO - u'talos_options': [u'--xperf_path',
14:47:06 INFO - u'"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'],
14:47:06 INFO - u'tests': [u'tp5n']}},
14:47:06 INFO - u'talos.zip': {u'path': u'',
14:47:06 INFO - u'url': u'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}}
14:47:06 INFO - Running post-action listener: _resource_record_post_action
14:47:06 INFO - [mozharness: 2016-11-08 22:47:06.467000Z] Finished populate-webroot step (success)
14:47:06 INFO - [mozharness: 2016-11-08 22:47:06.467000Z] Running create-virtualenv step.
14:47:06 INFO - Running pre-action listener: _resource_record_pre_action
14:47:06 INFO - Running main action method: create_virtualenv
14:47:06 INFO - Creating virtualenv C:\slave\test\build/venv
14:47:06 INFO - mkdir: C:\slave\test\build\venv\Scripts
14:47:06 INFO - Copying c:/mozilla-build/python27/python27.dll to C:\slave\test\build\venv\Scripts\python27.dll
14:47:06 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'!
14:47:06 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
14:47:06 INFO - Copy/paste: c:/mozilla-build/python27/python.exe c:/mozilla-build/buildbotve/virtualenv.py --no-site-packages --distribute C:\slave\test\build/venv
14:47:16 INFO - New python executable in C:\slave\test\build/venv\Scripts\python.exe
14:47:20 INFO - Installing distribute......................................................................................................................................................................................done.
14:47:21 INFO - Return code: 0
14:47:21 INFO - Getting output from command: ['C:\\slave\\test\\build\\venv\\Scripts\\pip', '--version']
14:47:21 INFO - Copy/paste: C:\slave\test\build\venv\Scripts\pip --version
14:47:21 INFO - Reading from file tmpfile_stdout
14:47:21 INFO - Output received:
14:47:21 INFO - pip 0.8.2 from c:\slave\test\build\venv\lib\site-packages\pip-0.8.2-py2.7.egg (python 2.7)
14:47:21 INFO - Using _rmtree_windows ...
14:47:21 INFO - Using _rmtree_windows ...
14:47:21 INFO - Installing pip>=1.5 into virtualenv C:\slave\test\build/venv
14:47:21 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')]}
14:47:21 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org
14:47:21 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')]}
14:47:21 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org
14:47:21 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 0x023EC640>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x0246DE30>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x028751F0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x02448E90>, '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 0x01E6A910>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x028B4520>, 'level': 'critical'}], 'cwd': 'C:\\slave\\test\\build', 'env': {'TMP': 'C:\\Users\\CLTBLD~1.T-W\\AppData\\Local\\Temp', 'TEST1': 'testie', 'COMPUTERNAME': 'T-W864-IX-042', 'USERDOMAIN': 'T-W864-IX-042', '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-042', 'LOCALAPPDATA': 'C:\\Users\\cltbld.T-W864-IX-042\\AppData\\Local', 'HOMEPATH': '\\Users\\cltbld.T-W864-IX-042', 'USERDOMAIN_ROAMINGPROFILE': 'T-W864-IX-042', 'MOZBUILDDIR': 'C:\\mozilla-build\\', 'PROGRAMW6432': 'C:\\Program Files', 'USERNAME': 'cltbld', 'LOGONSERVER': '\\\\T-W864-IX-042', '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-042\\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
14:47:21 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
14:47:21 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
14:47:21 INFO - Using env: {'ALLUSERSPROFILE': 'C:\\ProgramData',
14:47:21 INFO - 'APPDATA': 'C:\\Users\\cltbld.T-W864-IX-042\\AppData\\Roaming',
14:47:21 INFO - 'COMMONPROGRAMFILES': 'C:\\Program Files (x86)\\Common Files',
14:47:21 INFO - 'COMMONPROGRAMFILES(X86)': 'C:\\Program Files (x86)\\Common Files',
14:47:21 INFO - 'COMMONPROGRAMW6432': 'C:\\Program Files\\Common Files',
14:47:21 INFO - 'COMPUTERNAME': 'T-W864-IX-042',
14:47:21 INFO - 'COMSPEC': 'C:\\windows\\system32\\cmd.exe',
14:47:21 INFO - 'DCLOCATION': 'SCL3',
14:47:21 INFO - 'DNSSUFFIX': 'wintest.releng.scl3.mozilla.com',
14:47:21 INFO - 'FP_NO_HOST_CHECK': 'NO',
14:47:21 INFO - 'HOMEDRIVE': 'C:',
14:47:21 INFO - 'HOMEPATH': '\\Users\\cltbld.T-W864-IX-042',
14:47:21 INFO - 'KTS_HOME': 'C:\\Program Files\\KTS',
14:47:21 INFO - 'KTS_VERSION': '1.19c',
14:47:21 INFO - 'LOCALAPPDATA': 'C:\\Users\\cltbld.T-W864-IX-042\\AppData\\Local',
14:47:21 INFO - 'LOGONSERVER': '\\\\T-W864-IX-042',
14:47:21 INFO - 'MONDIR': 'C:\\Monitor_config\\',
14:47:21 INFO - 'MOZBUILDDIR': 'C:\\mozilla-build\\',
14:47:21 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1',
14:47:21 INFO - 'MOZ_NO_REMOTE': '1',
14:47:21 INFO - 'NO_EM_RESTART': '1',
14:47:21 INFO - 'NUMBER_OF_PROCESSORS': '8',
14:47:21 INFO - 'OS': 'Windows_NT',
14:47:21 INFO - 'OURDRIVE': 'C:',
14:47:21 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',
14:47:21 INFO - 'PATHEXT': '.COM;.EXE;.BAT;.CMD;.VBS;.VBE;.JS;.JSE;.WSF;.WSH;.MSC',
14:47:21 INFO - 'PROCESSOR_ARCHITECTURE': 'x86',
14:47:21 INFO - 'PROCESSOR_ARCHITEW6432': 'AMD64',
14:47:21 INFO - 'PROCESSOR_IDENTIFIER': 'Intel64 Family 6 Model 30 Stepping 5, GenuineIntel',
14:47:21 INFO - 'PROCESSOR_LEVEL': '6',
14:47:21 INFO - 'PROCESSOR_REVISION': '1e05',
14:47:21 INFO - 'PROGRAMDATA': 'C:\\ProgramData',
14:47:21 INFO - 'PROGRAMFILES': 'C:\\Program Files (x86)',
14:47:21 INFO - 'PROGRAMFILES(X86)': 'C:\\Program Files (x86)',
14:47:21 INFO - 'PROGRAMW6432': 'C:\\Program Files',
14:47:21 INFO - 'PROMPT': '$P$G',
14:47:21 INFO - 'PROPERTIES_FILE': 'C:\\slave\\test/buildprops.json',
14:47:21 INFO - 'PSMODULEPATH': 'C:\\windows\\system32\\WindowsPowerShell\\v1.0\\Modules\\',
14:47:21 INFO - 'PUBLIC': 'C:\\Users\\Public',
14:47:21 INFO - 'PWD': 'C:\\slave\\test',
14:47:21 INFO - 'RUNLOGFILE': 'C:\\slave\\\\runslave.log',
14:47:21 INFO - 'SLAVEDIR': 'C:\\slave\\',
14:47:21 INFO - 'SYSTEMDRIVE': 'C:',
14:47:21 INFO - 'SYSTEMROOT': 'C:\\windows',
14:47:21 INFO - 'TEMP': 'C:\\Users\\CLTBLD~1.T-W\\AppData\\Local\\Temp',
14:47:21 INFO - 'TEST1': 'testie',
14:47:21 INFO - 'TMP': 'C:\\Users\\CLTBLD~1.T-W\\AppData\\Local\\Temp',
14:47:21 INFO - 'USERDOMAIN': 'T-W864-IX-042',
14:47:21 INFO - 'USERDOMAIN_ROAMINGPROFILE': 'T-W864-IX-042',
14:47:21 INFO - 'USERNAME': 'cltbld',
14:47:21 INFO - 'USERPROFILE': 'C:\\Users\\cltbld.T-W864-IX-042',
14:47:21 INFO - 'WINDIR': 'C:\\windows',
14:47:21 INFO - 'XPCOM_DEBUG_BREAK': 'warn'}
14:47:22 INFO - Ignoring indexes: http://pypi.python.org/simple/
14:47:22 INFO - Downloading/unpacking pip>=1.5
14:47:27 INFO - Running setup.py egg_info for package pip
14:47:27 INFO - warning: no files found matching 'pip\cacert.pem'
14:47:27 INFO - warning: no files found matching '*.html' under directory 'docs'
14:47:27 INFO - warning: no previously-included files matching '*.rst' found under directory 'docs\_build'
14:47:27 INFO - no previously-included directories found matching 'docs\_build\_sources'
14:47:27 INFO - Installing collected packages: pip
14:47:27 INFO - Found existing installation: pip 0.8.2
14:47:27 INFO - Uninstalling pip:
14:47:27 INFO - Successfully uninstalled pip
14:47:27 INFO - Running setup.py install for pip
14:47:27 INFO - warning: no files found matching 'pip\cacert.pem'
14:47:27 INFO - warning: no files found matching '*.html' under directory 'docs'
14:47:27 INFO - warning: no previously-included files matching '*.rst' found under directory 'docs\_build'
14:47:27 INFO - no previously-included directories found matching 'docs\_build\_sources'
14:47:27 INFO - Installing pip-script.py script to C:\slave\test\build\venv\Scripts
14:47:27 INFO - Installing pip.exe script to C:\slave\test\build\venv\Scripts
14:47:27 INFO - Installing pip2.7-script.py script to C:\slave\test\build\venv\Scripts
14:47:27 INFO - Installing pip2.7.exe script to C:\slave\test\build\venv\Scripts
14:47:27 INFO - Installing pip2-script.py script to C:\slave\test\build\venv\Scripts
14:47:27 INFO - Installing pip2.exe script to C:\slave\test\build\venv\Scripts
14:47:27 INFO - Successfully installed pip
14:47:27 INFO - Cleaning up...
14:47:27 INFO - Return code: 0
14:47:27 INFO - Installing psutil>=3.1.1 into virtualenv C:\slave\test\build/venv
14:47:27 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]}
14:47:27 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org
14:47:27 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]}
14:47:27 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org
14:47:27 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 0x023EC640>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x0246DE30>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x028751F0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x02448E90>, '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 0x01E6A910>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x028B4520>, 'level': 'critical'}], 'cwd': 'C:\\slave\\test\\build', 'env': {'TMP': 'C:\\Users\\CLTBLD~1.T-W\\AppData\\Local\\Temp', 'TEST1': 'testie', 'COMPUTERNAME': 'T-W864-IX-042', 'USERDOMAIN': 'T-W864-IX-042', '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-042', 'LOCALAPPDATA': 'C:\\Users\\cltbld.T-W864-IX-042\\AppData\\Local', 'HOMEPATH': '\\Users\\cltbld.T-W864-IX-042', 'USERDOMAIN_ROAMINGPROFILE': 'T-W864-IX-042', 'MOZBUILDDIR': 'C:\\mozilla-build\\', 'PROGRAMW6432': 'C:\\Program Files', 'USERNAME': 'cltbld', 'LOGONSERVER': '\\\\T-W864-IX-042', '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-042\\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
14:47:27 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
14:47:27 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
14:47:27 INFO - Using env: {'ALLUSERSPROFILE': 'C:\\ProgramData',
14:47:27 INFO - 'APPDATA': 'C:\\Users\\cltbld.T-W864-IX-042\\AppData\\Roaming',
14:47:27 INFO - 'COMMONPROGRAMFILES': 'C:\\Program Files (x86)\\Common Files',
14:47:27 INFO - 'COMMONPROGRAMFILES(X86)': 'C:\\Program Files (x86)\\Common Files',
14:47:27 INFO - 'COMMONPROGRAMW6432': 'C:\\Program Files\\Common Files',
14:47:27 INFO - 'COMPUTERNAME': 'T-W864-IX-042',
14:47:27 INFO - 'COMSPEC': 'C:\\windows\\system32\\cmd.exe',
14:47:27 INFO - 'DCLOCATION': 'SCL3',
14:47:27 INFO - 'DNSSUFFIX': 'wintest.releng.scl3.mozilla.com',
14:47:27 INFO - 'FP_NO_HOST_CHECK': 'NO',
14:47:27 INFO - 'HOMEDRIVE': 'C:',
14:47:27 INFO - 'HOMEPATH': '\\Users\\cltbld.T-W864-IX-042',
14:47:27 INFO - 'KTS_HOME': 'C:\\Program Files\\KTS',
14:47:27 INFO - 'KTS_VERSION': '1.19c',
14:47:27 INFO - 'LOCALAPPDATA': 'C:\\Users\\cltbld.T-W864-IX-042\\AppData\\Local',
14:47:27 INFO - 'LOGONSERVER': '\\\\T-W864-IX-042',
14:47:27 INFO - 'MONDIR': 'C:\\Monitor_config\\',
14:47:27 INFO - 'MOZBUILDDIR': 'C:\\mozilla-build\\',
14:47:27 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1',
14:47:27 INFO - 'MOZ_NO_REMOTE': '1',
14:47:27 INFO - 'NO_EM_RESTART': '1',
14:47:27 INFO - 'NUMBER_OF_PROCESSORS': '8',
14:47:27 INFO - 'OS': 'Windows_NT',
14:47:27 INFO - 'OURDRIVE': 'C:',
14:47:27 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',
14:47:27 INFO - 'PATHEXT': '.COM;.EXE;.BAT;.CMD;.VBS;.VBE;.JS;.JSE;.WSF;.WSH;.MSC',
14:47:27 INFO - 'PROCESSOR_ARCHITECTURE': 'x86',
14:47:27 INFO - 'PROCESSOR_ARCHITEW6432': 'AMD64',
14:47:27 INFO - 'PROCESSOR_IDENTIFIER': 'Intel64 Family 6 Model 30 Stepping 5, GenuineIntel',
14:47:27 INFO - 'PROCESSOR_LEVEL': '6',
14:47:27 INFO - 'PROCESSOR_REVISION': '1e05',
14:47:27 INFO - 'PROGRAMDATA': 'C:\\ProgramData',
14:47:27 INFO - 'PROGRAMFILES': 'C:\\Program Files (x86)',
14:47:27 INFO - 'PROGRAMFILES(X86)': 'C:\\Program Files (x86)',
14:47:27 INFO - 'PROGRAMW6432': 'C:\\Program Files',
14:47:27 INFO - 'PROMPT': '$P$G',
14:47:27 INFO - 'PROPERTIES_FILE': 'C:\\slave\\test/buildprops.json',
14:47:27 INFO - 'PSMODULEPATH': 'C:\\windows\\system32\\WindowsPowerShell\\v1.0\\Modules\\',
14:47:27 INFO - 'PUBLIC': 'C:\\Users\\Public',
14:47:27 INFO - 'PWD': 'C:\\slave\\test',
14:47:27 INFO - 'RUNLOGFILE': 'C:\\slave\\\\runslave.log',
14:47:27 INFO - 'SLAVEDIR': 'C:\\slave\\',
14:47:27 INFO - 'SYSTEMDRIVE': 'C:',
14:47:27 INFO - 'SYSTEMROOT': 'C:\\windows',
14:47:27 INFO - 'TEMP': 'C:\\Users\\CLTBLD~1.T-W\\AppData\\Local\\Temp',
14:47:27 INFO - 'TEST1': 'testie',
14:47:27 INFO - 'TMP': 'C:\\Users\\CLTBLD~1.T-W\\AppData\\Local\\Temp',
14:47:27 INFO - 'USERDOMAIN': 'T-W864-IX-042',
14:47:27 INFO - 'USERDOMAIN_ROAMINGPROFILE': 'T-W864-IX-042',
14:47:27 INFO - 'USERNAME': 'cltbld',
14:47:27 INFO - 'USERPROFILE': 'C:\\Users\\cltbld.T-W864-IX-042',
14:47:27 INFO - 'WINDIR': 'C:\\windows',
14:47:27 INFO - 'XPCOM_DEBUG_BREAK': 'warn'}
14:47:29 INFO - Ignoring indexes: https://pypi.python.org/simple/
14:47:29 INFO - Downloading/unpacking psutil>=3.1.1
14:47:29 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available
14:47:29 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available
14:47:30 INFO - Installing collected packages: psutil
14:47:30 INFO - Successfully installed psutil
14:47:30 INFO - Cleaning up...
14:47:30 INFO - Return code: 0
14:47:30 INFO - Installing mozsystemmonitor==0.3 into virtualenv C:\slave\test\build/venv
14:47:30 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')]}
14:47:30 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org
14:47:30 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')]}
14:47:30 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org
14:47:30 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 0x023EC640>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x0246DE30>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x028751F0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x02448E90>, '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 0x01E6A910>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x028B4520>, 'level': 'critical'}], 'cwd': 'C:\\slave\\test\\build', 'env': {'TMP': 'C:\\Users\\CLTBLD~1.T-W\\AppData\\Local\\Temp', 'TEST1': 'testie', 'COMPUTERNAME': 'T-W864-IX-042', 'USERDOMAIN': 'T-W864-IX-042', '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-042', 'LOCALAPPDATA': 'C:\\Users\\cltbld.T-W864-IX-042\\AppData\\Local', 'HOMEPATH': '\\Users\\cltbld.T-W864-IX-042', 'USERDOMAIN_ROAMINGPROFILE': 'T-W864-IX-042', 'MOZBUILDDIR': 'C:\\mozilla-build\\', 'PROGRAMW6432': 'C:\\Program Files', 'USERNAME': 'cltbld', 'LOGONSERVER': '\\\\T-W864-IX-042', '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-042\\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
14:47:30 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
14:47:30 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
14:47:30 INFO - Using env: {'ALLUSERSPROFILE': 'C:\\ProgramData',
14:47:30 INFO - 'APPDATA': 'C:\\Users\\cltbld.T-W864-IX-042\\AppData\\Roaming',
14:47:30 INFO - 'COMMONPROGRAMFILES': 'C:\\Program Files (x86)\\Common Files',
14:47:30 INFO - 'COMMONPROGRAMFILES(X86)': 'C:\\Program Files (x86)\\Common Files',
14:47:30 INFO - 'COMMONPROGRAMW6432': 'C:\\Program Files\\Common Files',
14:47:30 INFO - 'COMPUTERNAME': 'T-W864-IX-042',
14:47:30 INFO - 'COMSPEC': 'C:\\windows\\system32\\cmd.exe',
14:47:30 INFO - 'DCLOCATION': 'SCL3',
14:47:30 INFO - 'DNSSUFFIX': 'wintest.releng.scl3.mozilla.com',
14:47:30 INFO - 'FP_NO_HOST_CHECK': 'NO',
14:47:30 INFO - 'HOMEDRIVE': 'C:',
14:47:30 INFO - 'HOMEPATH': '\\Users\\cltbld.T-W864-IX-042',
14:47:30 INFO - 'KTS_HOME': 'C:\\Program Files\\KTS',
14:47:30 INFO - 'KTS_VERSION': '1.19c',
14:47:30 INFO - 'LOCALAPPDATA': 'C:\\Users\\cltbld.T-W864-IX-042\\AppData\\Local',
14:47:30 INFO - 'LOGONSERVER': '\\\\T-W864-IX-042',
14:47:30 INFO - 'MONDIR': 'C:\\Monitor_config\\',
14:47:30 INFO - 'MOZBUILDDIR': 'C:\\mozilla-build\\',
14:47:30 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1',
14:47:30 INFO - 'MOZ_NO_REMOTE': '1',
14:47:30 INFO - 'NO_EM_RESTART': '1',
14:47:30 INFO - 'NUMBER_OF_PROCESSORS': '8',
14:47:30 INFO - 'OS': 'Windows_NT',
14:47:30 INFO - 'OURDRIVE': 'C:',
14:47:30 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',
14:47:30 INFO - 'PATHEXT': '.COM;.EXE;.BAT;.CMD;.VBS;.VBE;.JS;.JSE;.WSF;.WSH;.MSC',
14:47:30 INFO - 'PROCESSOR_ARCHITECTURE': 'x86',
14:47:30 INFO - 'PROCESSOR_ARCHITEW6432': 'AMD64',
14:47:30 INFO - 'PROCESSOR_IDENTIFIER': 'Intel64 Family 6 Model 30 Stepping 5, GenuineIntel',
14:47:30 INFO - 'PROCESSOR_LEVEL': '6',
14:47:30 INFO - 'PROCESSOR_REVISION': '1e05',
14:47:30 INFO - 'PROGRAMDATA': 'C:\\ProgramData',
14:47:30 INFO - 'PROGRAMFILES': 'C:\\Program Files (x86)',
14:47:30 INFO - 'PROGRAMFILES(X86)': 'C:\\Program Files (x86)',
14:47:30 INFO - 'PROGRAMW6432': 'C:\\Program Files',
14:47:30 INFO - 'PROMPT': '$P$G',
14:47:30 INFO - 'PROPERTIES_FILE': 'C:\\slave\\test/buildprops.json',
14:47:30 INFO - 'PSMODULEPATH': 'C:\\windows\\system32\\WindowsPowerShell\\v1.0\\Modules\\',
14:47:30 INFO - 'PUBLIC': 'C:\\Users\\Public',
14:47:30 INFO - 'PWD': 'C:\\slave\\test',
14:47:30 INFO - 'RUNLOGFILE': 'C:\\slave\\\\runslave.log',
14:47:30 INFO - 'SLAVEDIR': 'C:\\slave\\',
14:47:30 INFO - 'SYSTEMDRIVE': 'C:',
14:47:30 INFO - 'SYSTEMROOT': 'C:\\windows',
14:47:30 INFO - 'TEMP': 'C:\\Users\\CLTBLD~1.T-W\\AppData\\Local\\Temp',
14:47:30 INFO - 'TEST1': 'testie',
14:47:30 INFO - 'TMP': 'C:\\Users\\CLTBLD~1.T-W\\AppData\\Local\\Temp',
14:47:30 INFO - 'USERDOMAIN': 'T-W864-IX-042',
14:47:30 INFO - 'USERDOMAIN_ROAMINGPROFILE': 'T-W864-IX-042',
14:47:30 INFO - 'USERNAME': 'cltbld',
14:47:30 INFO - 'USERPROFILE': 'C:\\Users\\cltbld.T-W864-IX-042',
14:47:30 INFO - 'WINDIR': 'C:\\windows',
14:47:30 INFO - 'XPCOM_DEBUG_BREAK': 'warn'}
14:47:30 INFO - Ignoring indexes: https://pypi.python.org/simple/
14:47:30 INFO - Downloading/unpacking mozsystemmonitor==0.3
14:47:30 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
14:47:30 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
14:47:31 INFO - Downloading mozsystemmonitor-0.3.tar.gz
14:47:31 INFO - Running setup.py (path:C:\slave\test\build\venv\build\mozsystemmonitor\setup.py) egg_info for package mozsystemmonitor
14:47:32 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)
14:47:32 INFO - Installing collected packages: mozsystemmonitor
14:47:32 INFO - Running setup.py install for mozsystemmonitor
14:47:32 INFO - Successfully installed mozsystemmonitor
14:47:32 INFO - Cleaning up...
14:47:32 INFO - Return code: 0
14:47:32 INFO - Installing jsonschema==2.5.1 into virtualenv C:\slave\test\build/venv
14:47:32 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')]}
14:47:32 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org
14:47:32 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')]}
14:47:32 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org
14:47:32 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 0x023EC640>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x0246DE30>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x028751F0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x02448E90>, '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 0x01E6A910>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x028B4520>, 'level': 'critical'}], 'cwd': 'C:\\slave\\test\\build', 'env': {'TMP': 'C:\\Users\\CLTBLD~1.T-W\\AppData\\Local\\Temp', 'TEST1': 'testie', 'COMPUTERNAME': 'T-W864-IX-042', 'USERDOMAIN': 'T-W864-IX-042', '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-042', 'LOCALAPPDATA': 'C:\\Users\\cltbld.T-W864-IX-042\\AppData\\Local', 'HOMEPATH': '\\Users\\cltbld.T-W864-IX-042', 'USERDOMAIN_ROAMINGPROFILE': 'T-W864-IX-042', 'MOZBUILDDIR': 'C:\\mozilla-build\\', 'PROGRAMW6432': 'C:\\Program Files', 'USERNAME': 'cltbld', 'LOGONSERVER': '\\\\T-W864-IX-042', '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-042\\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
14:47:32 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
14:47:32 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
14:47:32 INFO - Using env: {'ALLUSERSPROFILE': 'C:\\ProgramData',
14:47:32 INFO - 'APPDATA': 'C:\\Users\\cltbld.T-W864-IX-042\\AppData\\Roaming',
14:47:32 INFO - 'COMMONPROGRAMFILES': 'C:\\Program Files (x86)\\Common Files',
14:47:32 INFO - 'COMMONPROGRAMFILES(X86)': 'C:\\Program Files (x86)\\Common Files',
14:47:32 INFO - 'COMMONPROGRAMW6432': 'C:\\Program Files\\Common Files',
14:47:32 INFO - 'COMPUTERNAME': 'T-W864-IX-042',
14:47:32 INFO - 'COMSPEC': 'C:\\windows\\system32\\cmd.exe',
14:47:32 INFO - 'DCLOCATION': 'SCL3',
14:47:32 INFO - 'DNSSUFFIX': 'wintest.releng.scl3.mozilla.com',
14:47:32 INFO - 'FP_NO_HOST_CHECK': 'NO',
14:47:32 INFO - 'HOMEDRIVE': 'C:',
14:47:32 INFO - 'HOMEPATH': '\\Users\\cltbld.T-W864-IX-042',
14:47:32 INFO - 'KTS_HOME': 'C:\\Program Files\\KTS',
14:47:32 INFO - 'KTS_VERSION': '1.19c',
14:47:32 INFO - 'LOCALAPPDATA': 'C:\\Users\\cltbld.T-W864-IX-042\\AppData\\Local',
14:47:32 INFO - 'LOGONSERVER': '\\\\T-W864-IX-042',
14:47:32 INFO - 'MONDIR': 'C:\\Monitor_config\\',
14:47:32 INFO - 'MOZBUILDDIR': 'C:\\mozilla-build\\',
14:47:32 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1',
14:47:32 INFO - 'MOZ_NO_REMOTE': '1',
14:47:32 INFO - 'NO_EM_RESTART': '1',
14:47:32 INFO - 'NUMBER_OF_PROCESSORS': '8',
14:47:32 INFO - 'OS': 'Windows_NT',
14:47:32 INFO - 'OURDRIVE': 'C:',
14:47:32 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',
14:47:32 INFO - 'PATHEXT': '.COM;.EXE;.BAT;.CMD;.VBS;.VBE;.JS;.JSE;.WSF;.WSH;.MSC',
14:47:32 INFO - 'PROCESSOR_ARCHITECTURE': 'x86',
14:47:32 INFO - 'PROCESSOR_ARCHITEW6432': 'AMD64',
14:47:32 INFO - 'PROCESSOR_IDENTIFIER': 'Intel64 Family 6 Model 30 Stepping 5, GenuineIntel',
14:47:32 INFO - 'PROCESSOR_LEVEL': '6',
14:47:32 INFO - 'PROCESSOR_REVISION': '1e05',
14:47:32 INFO - 'PROGRAMDATA': 'C:\\ProgramData',
14:47:32 INFO - 'PROGRAMFILES': 'C:\\Program Files (x86)',
14:47:32 INFO - 'PROGRAMFILES(X86)': 'C:\\Program Files (x86)',
14:47:32 INFO - 'PROGRAMW6432': 'C:\\Program Files',
14:47:32 INFO - 'PROMPT': '$P$G',
14:47:32 INFO - 'PROPERTIES_FILE': 'C:\\slave\\test/buildprops.json',
14:47:32 INFO - 'PSMODULEPATH': 'C:\\windows\\system32\\WindowsPowerShell\\v1.0\\Modules\\',
14:47:32 INFO - 'PUBLIC': 'C:\\Users\\Public',
14:47:32 INFO - 'PWD': 'C:\\slave\\test',
14:47:32 INFO - 'RUNLOGFILE': 'C:\\slave\\\\runslave.log',
14:47:32 INFO - 'SLAVEDIR': 'C:\\slave\\',
14:47:32 INFO - 'SYSTEMDRIVE': 'C:',
14:47:32 INFO - 'SYSTEMROOT': 'C:\\windows',
14:47:32 INFO - 'TEMP': 'C:\\Users\\CLTBLD~1.T-W\\AppData\\Local\\Temp',
14:47:32 INFO - 'TEST1': 'testie',
14:47:32 INFO - 'TMP': 'C:\\Users\\CLTBLD~1.T-W\\AppData\\Local\\Temp',
14:47:32 INFO - 'USERDOMAIN': 'T-W864-IX-042',
14:47:32 INFO - 'USERDOMAIN_ROAMINGPROFILE': 'T-W864-IX-042',
14:47:32 INFO - 'USERNAME': 'cltbld',
14:47:32 INFO - 'USERPROFILE': 'C:\\Users\\cltbld.T-W864-IX-042',
14:47:32 INFO - 'WINDIR': 'C:\\windows',
14:47:32 INFO - 'XPCOM_DEBUG_BREAK': 'warn'}
14:47:32 INFO - Ignoring indexes: https://pypi.python.org/simple/
14:47:32 INFO - Downloading/unpacking jsonschema==2.5.1
14:47:32 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
14:47:32 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
14:47:33 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl
14:47:33 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1)
14:47:33 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
14:47:33 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
14:47:33 INFO - Downloading functools32-3.2.3-2.tar.gz
14:47:33 INFO - Running setup.py (path:C:\slave\test\build\venv\build\functools32\setup.py) egg_info for package functools32
14:47:33 INFO - warning: no files found matching '*.txt'
14:47:33 INFO - no previously-included directories found matching 'build'
14:47:33 INFO - no previously-included directories found matching 'dist'
14:47:33 INFO - no previously-included directories found matching '.git*'
14:47:33 INFO - Installing collected packages: jsonschema, functools32
14:47:34 INFO - Running setup.py install for functools32
14:47:34 INFO - warning: no files found matching '*.txt'
14:47:34 INFO - no previously-included directories found matching 'build'
14:47:34 INFO - no previously-included directories found matching 'dist'
14:47:34 INFO - no previously-included directories found matching '.git*'
14:47:34 INFO - Successfully installed jsonschema functools32
14:47:34 INFO - Cleaning up...
14:47:34 INFO - Return code: 0
14:47:34 INFO - Installing functools32==3.2.3-2 into virtualenv C:\slave\test\build/venv
14:47: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')]}
14:47:34 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org
14:47: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')]}
14:47:34 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org
14:47: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', '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 0x023EC640>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x0246DE30>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x028751F0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x02448E90>, '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 0x01E6A910>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x028B4520>, 'level': 'critical'}], 'cwd': 'C:\\slave\\test\\build', 'env': {'TMP': 'C:\\Users\\CLTBLD~1.T-W\\AppData\\Local\\Temp', 'TEST1': 'testie', 'COMPUTERNAME': 'T-W864-IX-042', 'USERDOMAIN': 'T-W864-IX-042', '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-042', 'LOCALAPPDATA': 'C:\\Users\\cltbld.T-W864-IX-042\\AppData\\Local', 'HOMEPATH': '\\Users\\cltbld.T-W864-IX-042', 'USERDOMAIN_ROAMINGPROFILE': 'T-W864-IX-042', 'MOZBUILDDIR': 'C:\\mozilla-build\\', 'PROGRAMW6432': 'C:\\Program Files', 'USERNAME': 'cltbld', 'LOGONSERVER': '\\\\T-W864-IX-042', '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-042\\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
14:47: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', 'functools32==3.2.3-2'] in C:\slave\test\build
14:47: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 functools32==3.2.3-2
14:47:34 INFO - Using env: {'ALLUSERSPROFILE': 'C:\\ProgramData',
14:47:34 INFO - 'APPDATA': 'C:\\Users\\cltbld.T-W864-IX-042\\AppData\\Roaming',
14:47:34 INFO - 'COMMONPROGRAMFILES': 'C:\\Program Files (x86)\\Common Files',
14:47:34 INFO - 'COMMONPROGRAMFILES(X86)': 'C:\\Program Files (x86)\\Common Files',
14:47:34 INFO - 'COMMONPROGRAMW6432': 'C:\\Program Files\\Common Files',
14:47:34 INFO - 'COMPUTERNAME': 'T-W864-IX-042',
14:47:34 INFO - 'COMSPEC': 'C:\\windows\\system32\\cmd.exe',
14:47:34 INFO - 'DCLOCATION': 'SCL3',
14:47:34 INFO - 'DNSSUFFIX': 'wintest.releng.scl3.mozilla.com',
14:47:34 INFO - 'FP_NO_HOST_CHECK': 'NO',
14:47:34 INFO - 'HOMEDRIVE': 'C:',
14:47:34 INFO - 'HOMEPATH': '\\Users\\cltbld.T-W864-IX-042',
14:47:34 INFO - 'KTS_HOME': 'C:\\Program Files\\KTS',
14:47:34 INFO - 'KTS_VERSION': '1.19c',
14:47:34 INFO - 'LOCALAPPDATA': 'C:\\Users\\cltbld.T-W864-IX-042\\AppData\\Local',
14:47:34 INFO - 'LOGONSERVER': '\\\\T-W864-IX-042',
14:47:34 INFO - 'MONDIR': 'C:\\Monitor_config\\',
14:47:34 INFO - 'MOZBUILDDIR': 'C:\\mozilla-build\\',
14:47:34 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1',
14:47:34 INFO - 'MOZ_NO_REMOTE': '1',
14:47:34 INFO - 'NO_EM_RESTART': '1',
14:47:34 INFO - 'NUMBER_OF_PROCESSORS': '8',
14:47:34 INFO - 'OS': 'Windows_NT',
14:47:34 INFO - 'OURDRIVE': 'C:',
14:47: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',
14:47:34 INFO - 'PATHEXT': '.COM;.EXE;.BAT;.CMD;.VBS;.VBE;.JS;.JSE;.WSF;.WSH;.MSC',
14:47:34 INFO - 'PROCESSOR_ARCHITECTURE': 'x86',
14:47:34 INFO - 'PROCESSOR_ARCHITEW6432': 'AMD64',
14:47:34 INFO - 'PROCESSOR_IDENTIFIER': 'Intel64 Family 6 Model 30 Stepping 5, GenuineIntel',
14:47:34 INFO - 'PROCESSOR_LEVEL': '6',
14:47:34 INFO - 'PROCESSOR_REVISION': '1e05',
14:47:34 INFO - 'PROGRAMDATA': 'C:\\ProgramData',
14:47:34 INFO - 'PROGRAMFILES': 'C:\\Program Files (x86)',
14:47:34 INFO - 'PROGRAMFILES(X86)': 'C:\\Program Files (x86)',
14:47:34 INFO - 'PROGRAMW6432': 'C:\\Program Files',
14:47:34 INFO - 'PROMPT': '$P$G',
14:47:34 INFO - 'PROPERTIES_FILE': 'C:\\slave\\test/buildprops.json',
14:47:34 INFO - 'PSMODULEPATH': 'C:\\windows\\system32\\WindowsPowerShell\\v1.0\\Modules\\',
14:47:34 INFO - 'PUBLIC': 'C:\\Users\\Public',
14:47:34 INFO - 'PWD': 'C:\\slave\\test',
14:47:34 INFO - 'RUNLOGFILE': 'C:\\slave\\\\runslave.log',
14:47:34 INFO - 'SLAVEDIR': 'C:\\slave\\',
14:47:34 INFO - 'SYSTEMDRIVE': 'C:',
14:47:34 INFO - 'SYSTEMROOT': 'C:\\windows',
14:47:34 INFO - 'TEMP': 'C:\\Users\\CLTBLD~1.T-W\\AppData\\Local\\Temp',
14:47:34 INFO - 'TEST1': 'testie',
14:47:34 INFO - 'TMP': 'C:\\Users\\CLTBLD~1.T-W\\AppData\\Local\\Temp',
14:47:34 INFO - 'USERDOMAIN': 'T-W864-IX-042',
14:47:34 INFO - 'USERDOMAIN_ROAMINGPROFILE': 'T-W864-IX-042',
14:47:34 INFO - 'USERNAME': 'cltbld',
14:47:34 INFO - 'USERPROFILE': 'C:\\Users\\cltbld.T-W864-IX-042',
14:47:34 INFO - 'WINDIR': 'C:\\windows',
14:47:34 INFO - 'XPCOM_DEBUG_BREAK': 'warn'}
14:47:35 INFO - Ignoring indexes: https://pypi.python.org/simple/
14:47:35 INFO - Requirement already satisfied (use --upgrade to upgrade): functools32==3.2.3-2 in c:\slave\test\build\venv\lib\site-packages
14:47:35 INFO - Cleaning up...
14:47:35 INFO - Return code: 0
14:47:35 INFO - Installing blobuploader==1.2.4 into virtualenv C:\slave\test\build/venv
14:47:35 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]}
14:47:35 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org
14:47:35 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]}
14:47:35 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org
14:47:35 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 0x023EC640>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x0246DE30>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x028751F0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x02448E90>, '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 0x01E6A910>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x028B4520>, 'level': 'critical'}], 'cwd': 'C:\\slave\\test\\build', 'env': {'TMP': 'C:\\Users\\CLTBLD~1.T-W\\AppData\\Local\\Temp', 'TEST1': 'testie', 'COMPUTERNAME': 'T-W864-IX-042', 'USERDOMAIN': 'T-W864-IX-042', '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-042', 'LOCALAPPDATA': 'C:\\Users\\cltbld.T-W864-IX-042\\AppData\\Local', 'HOMEPATH': '\\Users\\cltbld.T-W864-IX-042', 'USERDOMAIN_ROAMINGPROFILE': 'T-W864-IX-042', 'MOZBUILDDIR': 'C:\\mozilla-build\\', 'PROGRAMW6432': 'C:\\Program Files', 'USERNAME': 'cltbld', 'LOGONSERVER': '\\\\T-W864-IX-042', '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-042\\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
14:47:35 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
14:47:35 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
14:47:35 INFO - Using env: {'ALLUSERSPROFILE': 'C:\\ProgramData',
14:47:35 INFO - 'APPDATA': 'C:\\Users\\cltbld.T-W864-IX-042\\AppData\\Roaming',
14:47:35 INFO - 'COMMONPROGRAMFILES': 'C:\\Program Files (x86)\\Common Files',
14:47:35 INFO - 'COMMONPROGRAMFILES(X86)': 'C:\\Program Files (x86)\\Common Files',
14:47:35 INFO - 'COMMONPROGRAMW6432': 'C:\\Program Files\\Common Files',
14:47:35 INFO - 'COMPUTERNAME': 'T-W864-IX-042',
14:47:35 INFO - 'COMSPEC': 'C:\\windows\\system32\\cmd.exe',
14:47:35 INFO - 'DCLOCATION': 'SCL3',
14:47:35 INFO - 'DNSSUFFIX': 'wintest.releng.scl3.mozilla.com',
14:47:35 INFO - 'FP_NO_HOST_CHECK': 'NO',
14:47:35 INFO - 'HOMEDRIVE': 'C:',
14:47:35 INFO - 'HOMEPATH': '\\Users\\cltbld.T-W864-IX-042',
14:47:35 INFO - 'KTS_HOME': 'C:\\Program Files\\KTS',
14:47:35 INFO - 'KTS_VERSION': '1.19c',
14:47:35 INFO - 'LOCALAPPDATA': 'C:\\Users\\cltbld.T-W864-IX-042\\AppData\\Local',
14:47:35 INFO - 'LOGONSERVER': '\\\\T-W864-IX-042',
14:47:35 INFO - 'MONDIR': 'C:\\Monitor_config\\',
14:47:35 INFO - 'MOZBUILDDIR': 'C:\\mozilla-build\\',
14:47:35 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1',
14:47:35 INFO - 'MOZ_NO_REMOTE': '1',
14:47:35 INFO - 'NO_EM_RESTART': '1',
14:47:35 INFO - 'NUMBER_OF_PROCESSORS': '8',
14:47:35 INFO - 'OS': 'Windows_NT',
14:47:35 INFO - 'OURDRIVE': 'C:',
14:47:35 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',
14:47:35 INFO - 'PATHEXT': '.COM;.EXE;.BAT;.CMD;.VBS;.VBE;.JS;.JSE;.WSF;.WSH;.MSC',
14:47:35 INFO - 'PROCESSOR_ARCHITECTURE': 'x86',
14:47:35 INFO - 'PROCESSOR_ARCHITEW6432': 'AMD64',
14:47:35 INFO - 'PROCESSOR_IDENTIFIER': 'Intel64 Family 6 Model 30 Stepping 5, GenuineIntel',
14:47:35 INFO - 'PROCESSOR_LEVEL': '6',
14:47:35 INFO - 'PROCESSOR_REVISION': '1e05',
14:47:35 INFO - 'PROGRAMDATA': 'C:\\ProgramData',
14:47:35 INFO - 'PROGRAMFILES': 'C:\\Program Files (x86)',
14:47:35 INFO - 'PROGRAMFILES(X86)': 'C:\\Program Files (x86)',
14:47:35 INFO - 'PROGRAMW6432': 'C:\\Program Files',
14:47:35 INFO - 'PROMPT': '$P$G',
14:47:35 INFO - 'PROPERTIES_FILE': 'C:\\slave\\test/buildprops.json',
14:47:35 INFO - 'PSMODULEPATH': 'C:\\windows\\system32\\WindowsPowerShell\\v1.0\\Modules\\',
14:47:35 INFO - 'PUBLIC': 'C:\\Users\\Public',
14:47:35 INFO - 'PWD': 'C:\\slave\\test',
14:47:35 INFO - 'RUNLOGFILE': 'C:\\slave\\\\runslave.log',
14:47:35 INFO - 'SLAVEDIR': 'C:\\slave\\',
14:47:35 INFO - 'SYSTEMDRIVE': 'C:',
14:47:35 INFO - 'SYSTEMROOT': 'C:\\windows',
14:47:35 INFO - 'TEMP': 'C:\\Users\\CLTBLD~1.T-W\\AppData\\Local\\Temp',
14:47:35 INFO - 'TEST1': 'testie',
14:47:35 INFO - 'TMP': 'C:\\Users\\CLTBLD~1.T-W\\AppData\\Local\\Temp',
14:47:35 INFO - 'USERDOMAIN': 'T-W864-IX-042',
14:47:35 INFO - 'USERDOMAIN_ROAMINGPROFILE': 'T-W864-IX-042',
14:47:35 INFO - 'USERNAME': 'cltbld',
14:47:35 INFO - 'USERPROFILE': 'C:\\Users\\cltbld.T-W864-IX-042',
14:47:35 INFO - 'WINDIR': 'C:\\windows',
14:47:35 INFO - 'XPCOM_DEBUG_BREAK': 'warn'}
14:47:35 INFO - Ignoring indexes: https://pypi.python.org/simple/
14:47:35 INFO - Downloading/unpacking blobuploader==1.2.4
14:47:35 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
14:47:35 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
14:47:36 INFO - Downloading blobuploader-1.2.4.tar.gz
14:47:36 INFO - Running setup.py (path:C:\slave\test\build\venv\build\blobuploader\setup.py) egg_info for package blobuploader
14:47:36 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4)
14:47:36 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
14:47:36 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
14:47:36 INFO - Running setup.py (path:C:\slave\test\build\venv\build\requests\setup.py) egg_info for package requests
14:47:36 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4)
14:47:36 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
14:47:36 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
14:47:37 INFO - Downloading docopt-0.6.1.tar.gz
14:47:37 INFO - Running setup.py (path:C:\slave\test\build\venv\build\docopt\setup.py) egg_info for package docopt
14:47:37 INFO - Installing collected packages: blobuploader, requests, docopt
14:47:37 INFO - Running setup.py install for blobuploader
14:47:37 INFO - Running setup.py install for requests
14:47:37 INFO - Running setup.py install for docopt
14:47:38 INFO - Successfully installed blobuploader requests docopt
14:47:38 INFO - Cleaning up...
14:47:39 INFO - Return code: 0
14:47:39 INFO - Installing None into virtualenv C:\slave\test\build/venv
14:47: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')]}
14:47:39 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org
14:47: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')]}
14:47:39 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org
14:47:39 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 0x023EC640>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x0246DE30>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x028751F0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x02448E90>, '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 0x01E6A910>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x028B4520>, '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-042', 'USERDOMAIN': 'T-W864-IX-042', '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-042', 'LOCALAPPDATA': 'C:\\Users\\cltbld.T-W864-IX-042\\AppData\\Local', 'HOMEPATH': '\\Users\\cltbld.T-W864-IX-042', 'USERDOMAIN_ROAMINGPROFILE': 'T-W864-IX-042', 'MOZBUILDDIR': 'C:\\mozilla-build\\', 'PROGRAMW6432': 'C:\\Program Files', 'USERNAME': 'cltbld', 'LOGONSERVER': '\\\\T-W864-IX-042', '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-042\\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
14:47:39 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
14:47:39 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
14:47:39 INFO - Using env: {'ALLUSERSPROFILE': 'C:\\ProgramData',
14:47:39 INFO - 'APPDATA': 'C:\\Users\\cltbld.T-W864-IX-042\\AppData\\Roaming',
14:47:39 INFO - 'COMMONPROGRAMFILES': 'C:\\Program Files (x86)\\Common Files',
14:47:39 INFO - 'COMMONPROGRAMFILES(X86)': 'C:\\Program Files (x86)\\Common Files',
14:47:39 INFO - 'COMMONPROGRAMW6432': 'C:\\Program Files\\Common Files',
14:47:39 INFO - 'COMPUTERNAME': 'T-W864-IX-042',
14:47:39 INFO - 'COMSPEC': 'C:\\windows\\system32\\cmd.exe',
14:47:39 INFO - 'DCLOCATION': 'SCL3',
14:47:39 INFO - 'DNSSUFFIX': 'wintest.releng.scl3.mozilla.com',
14:47:39 INFO - 'FP_NO_HOST_CHECK': 'NO',
14:47:39 INFO - 'HOMEDRIVE': 'C:',
14:47:39 INFO - 'HOMEPATH': '\\Users\\cltbld.T-W864-IX-042',
14:47:39 INFO - 'KTS_HOME': 'C:\\Program Files\\KTS',
14:47:39 INFO - 'KTS_VERSION': '1.19c',
14:47:39 INFO - 'LOCALAPPDATA': 'C:\\Users\\cltbld.T-W864-IX-042\\AppData\\Local',
14:47:39 INFO - 'LOGONSERVER': '\\\\T-W864-IX-042',
14:47:39 INFO - 'MONDIR': 'C:\\Monitor_config\\',
14:47:39 INFO - 'MOZBUILDDIR': 'C:\\mozilla-build\\',
14:47:39 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1',
14:47:39 INFO - 'MOZ_NO_REMOTE': '1',
14:47:39 INFO - 'NO_EM_RESTART': '1',
14:47:39 INFO - 'NUMBER_OF_PROCESSORS': '8',
14:47:39 INFO - 'OS': 'Windows_NT',
14:47:39 INFO - 'OURDRIVE': 'C:',
14:47:39 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',
14:47:39 INFO - 'PATHEXT': '.COM;.EXE;.BAT;.CMD;.VBS;.VBE;.JS;.JSE;.WSF;.WSH;.MSC',
14:47:39 INFO - 'PROCESSOR_ARCHITECTURE': 'x86',
14:47:39 INFO - 'PROCESSOR_ARCHITEW6432': 'AMD64',
14:47:39 INFO - 'PROCESSOR_IDENTIFIER': 'Intel64 Family 6 Model 30 Stepping 5, GenuineIntel',
14:47:39 INFO - 'PROCESSOR_LEVEL': '6',
14:47:39 INFO - 'PROCESSOR_REVISION': '1e05',
14:47:39 INFO - 'PROGRAMDATA': 'C:\\ProgramData',
14:47:39 INFO - 'PROGRAMFILES': 'C:\\Program Files (x86)',
14:47:39 INFO - 'PROGRAMFILES(X86)': 'C:\\Program Files (x86)',
14:47:39 INFO - 'PROGRAMW6432': 'C:\\Program Files',
14:47:39 INFO - 'PROMPT': '$P$G',
14:47:39 INFO - 'PROPERTIES_FILE': 'C:\\slave\\test/buildprops.json',
14:47:39 INFO - 'PSMODULEPATH': 'C:\\windows\\system32\\WindowsPowerShell\\v1.0\\Modules\\',
14:47:39 INFO - 'PUBLIC': 'C:\\Users\\Public',
14:47:39 INFO - 'PWD': 'C:\\slave\\test',
14:47:39 INFO - 'RUNLOGFILE': 'C:\\slave\\\\runslave.log',
14:47:39 INFO - 'SLAVEDIR': 'C:\\slave\\',
14:47:39 INFO - 'SYSTEMDRIVE': 'C:',
14:47:39 INFO - 'SYSTEMROOT': 'C:\\windows',
14:47:39 INFO - 'TEMP': 'C:\\Users\\CLTBLD~1.T-W\\AppData\\Local\\Temp',
14:47:39 INFO - 'TEST1': 'testie',
14:47:39 INFO - 'TMP': 'C:\\Users\\CLTBLD~1.T-W\\AppData\\Local\\Temp',
14:47:39 INFO - 'USERDOMAIN': 'T-W864-IX-042',
14:47:39 INFO - 'USERDOMAIN_ROAMINGPROFILE': 'T-W864-IX-042',
14:47:39 INFO - 'USERNAME': 'cltbld',
14:47:39 INFO - 'USERPROFILE': 'C:\\Users\\cltbld.T-W864-IX-042',
14:47:39 INFO - 'WINDIR': 'C:\\windows',
14:47:39 INFO - 'XPCOM_DEBUG_BREAK': 'warn'}
14:47:39 INFO - Ignoring indexes: https://pypi.python.org/simple/
14:47:39 INFO - Unpacking c:\slave\test\build\tests\mozbase\manifestparser
14:47:39 INFO - Running setup.py (path:c:\users\cltbld~1.t-w\appdata\local\temp\pip-oiz4ww-build\setup.py) egg_info for package from file:///C:/slave/test/build/tests/mozbase/manifestparser
14:47:39 INFO - Unpacking c:\slave\test\build\tests\mozbase\mozcrash
14:47:39 INFO - Running setup.py (path:c:\users\cltbld~1.t-w\appdata\local\temp\pip-2k0gih-build\setup.py) egg_info for package from file:///C:/slave/test/build/tests/mozbase/mozcrash
14:47:40 INFO - Unpacking c:\slave\test\build\tests\mozbase\mozdebug
14:47:40 INFO - Running setup.py (path:c:\users\cltbld~1.t-w\appdata\local\temp\pip-njzpnq-build\setup.py) egg_info for package from file:///C:/slave/test/build/tests/mozbase/mozdebug
14:47:40 INFO - Unpacking c:\slave\test\build\tests\mozbase\mozdevice
14:47:40 INFO - Running setup.py (path:c:\users\cltbld~1.t-w\appdata\local\temp\pip-dxlsof-build\setup.py) egg_info for package from file:///C:/slave/test/build/tests/mozbase/mozdevice
14:47:40 INFO - Unpacking c:\slave\test\build\tests\mozbase\mozfile
14:47:40 INFO - Running setup.py (path:c:\users\cltbld~1.t-w\appdata\local\temp\pip-wtbbhw-build\setup.py) egg_info for package from file:///C:/slave/test/build/tests/mozbase/mozfile
14:47:40 INFO - Unpacking c:\slave\test\build\tests\mozbase\mozhttpd
14:47:40 INFO - Running setup.py (path:c:\users\cltbld~1.t-w\appdata\local\temp\pip-3ew2jy-build\setup.py) egg_info for package from file:///C:/slave/test/build/tests/mozbase/mozhttpd
14:47:40 INFO - Unpacking c:\slave\test\build\tests\mozbase\mozinfo
14:47:40 INFO - Running setup.py (path:c:\users\cltbld~1.t-w\appdata\local\temp\pip-hwjm91-build\setup.py) egg_info for package from file:///C:/slave/test/build/tests/mozbase/mozinfo
14:47:40 INFO - Unpacking c:\slave\test\build\tests\mozbase\mozinstall
14:47:40 INFO - Running setup.py (path:c:\users\cltbld~1.t-w\appdata\local\temp\pip-kxqo3r-build\setup.py) egg_info for package from file:///C:/slave/test/build/tests/mozbase/mozinstall
14:47:40 INFO - Unpacking c:\slave\test\build\tests\mozbase\mozleak
14:47:40 INFO - Running setup.py (path:c:\users\cltbld~1.t-w\appdata\local\temp\pip-dm9d7y-build\setup.py) egg_info for package from file:///C:/slave/test/build/tests/mozbase/mozleak
14:47:40 INFO - Unpacking c:\slave\test\build\tests\mozbase\mozlog
14:47:40 INFO - Running setup.py (path:c:\users\cltbld~1.t-w\appdata\local\temp\pip-wlikhy-build\setup.py) egg_info for package from file:///C:/slave/test/build/tests/mozbase/mozlog
14:47:40 INFO - Unpacking c:\slave\test\build\tests\mozbase\moznetwork
14:47:40 INFO - Running setup.py (path:c:\users\cltbld~1.t-w\appdata\local\temp\pip-nrewsm-build\setup.py) egg_info for package from file:///C:/slave/test/build/tests/mozbase/moznetwork
14:47:41 INFO - Unpacking c:\slave\test\build\tests\mozbase\mozprocess
14:47:41 INFO - Running setup.py (path:c:\users\cltbld~1.t-w\appdata\local\temp\pip-igqkep-build\setup.py) egg_info for package from file:///C:/slave/test/build/tests/mozbase/mozprocess
14:47:41 INFO - Unpacking c:\slave\test\build\tests\mozbase\mozprofile
14:47:41 INFO - Running setup.py (path:c:\users\cltbld~1.t-w\appdata\local\temp\pip-q_pc7d-build\setup.py) egg_info for package from file:///C:/slave/test/build/tests/mozbase/mozprofile
14:47:41 INFO - Unpacking c:\slave\test\build\tests\mozbase\mozrunner
14:47:41 INFO - Running setup.py (path:c:\users\cltbld~1.t-w\appdata\local\temp\pip-k_4yyr-build\setup.py) egg_info for package from file:///C:/slave/test/build/tests/mozbase/mozrunner
14:47:41 INFO - Unpacking c:\slave\test\build\tests\mozbase\mozscreenshot
14:47:41 INFO - Running setup.py (path:c:\users\cltbld~1.t-w\appdata\local\temp\pip-4u5sxs-build\setup.py) egg_info for package from file:///C:/slave/test/build/tests/mozbase/mozscreenshot
14:47:41 INFO - Unpacking c:\slave\test\build\tests\mozbase\moztest
14:47:41 INFO - Running setup.py (path:c:\users\cltbld~1.t-w\appdata\local\temp\pip-whbpic-build\setup.py) egg_info for package from file:///C:/slave/test/build/tests/mozbase/moztest
14:47:41 INFO - Unpacking c:\slave\test\build\tests\mozbase\mozversion
14:47:41 INFO - Running setup.py (path:c:\users\cltbld~1.t-w\appdata\local\temp\pip-esdxwm-build\setup.py) egg_info for package from file:///C:/slave/test/build/tests/mozbase/mozversion
14:47:42 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion
14:47:42 INFO - Running setup.py install for manifestparser
14:47:42 INFO - Installing manifestparser-script.py script to C:\slave\test\build\venv\Scripts
14:47:42 INFO - Installing manifestparser.exe script to C:\slave\test\build\venv\Scripts
14:47:42 INFO - Running setup.py install for mozcrash
14:47:42 INFO - Running setup.py install for mozdebug
14:47:43 INFO - Running setup.py install for mozdevice
14:47:43 INFO - Installing sutini-script.py script to C:\slave\test\build\venv\Scripts
14:47:43 INFO - Installing sutini.exe script to C:\slave\test\build\venv\Scripts
14:47:43 INFO - Installing dm-script.py script to C:\slave\test\build\venv\Scripts
14:47:43 INFO - Installing dm.exe script to C:\slave\test\build\venv\Scripts
14:47:43 INFO - Running setup.py install for mozfile
14:47:44 INFO - Running setup.py install for mozhttpd
14:47:44 INFO - Installing mozhttpd-script.py script to C:\slave\test\build\venv\Scripts
14:47:44 INFO - Installing mozhttpd.exe script to C:\slave\test\build\venv\Scripts
14:47:44 INFO - Running setup.py install for mozinfo
14:47:45 INFO - Installing mozinfo-script.py script to C:\slave\test\build\venv\Scripts
14:47:45 INFO - Installing mozinfo.exe script to C:\slave\test\build\venv\Scripts
14:47:45 INFO - Running setup.py install for mozInstall
14:47:45 INFO - Installing moz_remove_from_system-script.py script to C:\slave\test\build\venv\Scripts
14:47:45 INFO - Installing moz_remove_from_system.exe script to C:\slave\test\build\venv\Scripts
14:47:45 INFO - Installing mozuninstall-script.py script to C:\slave\test\build\venv\Scripts
14:47:45 INFO - Installing mozuninstall.exe script to C:\slave\test\build\venv\Scripts
14:47:45 INFO - Installing mozinstall-script.py script to C:\slave\test\build\venv\Scripts
14:47:45 INFO - Installing mozinstall.exe script to C:\slave\test\build\venv\Scripts
14:47:45 INFO - Installing moz_add_to_system-script.py script to C:\slave\test\build\venv\Scripts
14:47:45 INFO - Installing moz_add_to_system.exe script to C:\slave\test\build\venv\Scripts
14:47:45 INFO - Running setup.py install for mozleak
14:47:45 INFO - Running setup.py install for mozlog
14:47:46 INFO - Installing structlog-script.py script to C:\slave\test\build\venv\Scripts
14:47:46 INFO - Installing structlog.exe script to C:\slave\test\build\venv\Scripts
14:47:46 INFO - Running setup.py install for moznetwork
14:47:46 INFO - Installing moznetwork-script.py script to C:\slave\test\build\venv\Scripts
14:47:46 INFO - Installing moznetwork.exe script to C:\slave\test\build\venv\Scripts
14:47:47 INFO - Running setup.py install for mozprocess
14:47:47 INFO - Running setup.py install for mozprofile
14:47:48 INFO - Installing mozprofile-script.py script to C:\slave\test\build\venv\Scripts
14:47:48 INFO - Installing mozprofile.exe script to C:\slave\test\build\venv\Scripts
14:47:48 INFO - Installing diff-profiles-script.py script to C:\slave\test\build\venv\Scripts
14:47:48 INFO - Installing diff-profiles.exe script to C:\slave\test\build\venv\Scripts
14:47:48 INFO - Installing view-profile-script.py script to C:\slave\test\build\venv\Scripts
14:47:48 INFO - Installing view-profile.exe script to C:\slave\test\build\venv\Scripts
14:47:48 INFO - Running setup.py install for mozrunner
14:47:48 INFO - Installing mozrunner-script.py script to C:\slave\test\build\venv\Scripts
14:47:48 INFO - Installing mozrunner.exe script to C:\slave\test\build\venv\Scripts
14:47:49 INFO - Running setup.py install for mozscreenshot
14:47:49 INFO - Running setup.py install for moztest
14:47:50 INFO - Running setup.py install for mozversion
14:47:50 INFO - Installing mozversion-script.py script to C:\slave\test\build\venv\Scripts
14:47:50 INFO - Installing mozversion.exe script to C:\slave\test\build\venv\Scripts
14:47:50 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion
14:47:50 INFO - Cleaning up...
14:47:50 INFO - Return code: 0
14:47:50 INFO - Installing None into virtualenv C:\slave\test\build/venv
14:47:50 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]}
14:47:50 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org
14:47:50 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]}
14:47:50 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org
14:47:50 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 0x023EC640>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x0246DE30>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x028751F0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x02448E90>, '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 0x01E6A910>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x028B4520>, '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-042', 'USERDOMAIN': 'T-W864-IX-042', '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-042', 'LOCALAPPDATA': 'C:\\Users\\cltbld.T-W864-IX-042\\AppData\\Local', 'HOMEPATH': '\\Users\\cltbld.T-W864-IX-042', 'USERDOMAIN_ROAMINGPROFILE': 'T-W864-IX-042', 'MOZBUILDDIR': 'C:\\mozilla-build\\', 'PROGRAMW6432': 'C:\\Program Files', 'USERNAME': 'cltbld', 'LOGONSERVER': '\\\\T-W864-IX-042', '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-042\\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
14:47:50 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
14:47:50 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
14:47:50 INFO - Using env: {'ALLUSERSPROFILE': 'C:\\ProgramData',
14:47:50 INFO - 'APPDATA': 'C:\\Users\\cltbld.T-W864-IX-042\\AppData\\Roaming',
14:47:50 INFO - 'COMMONPROGRAMFILES': 'C:\\Program Files (x86)\\Common Files',
14:47:50 INFO - 'COMMONPROGRAMFILES(X86)': 'C:\\Program Files (x86)\\Common Files',
14:47:50 INFO - 'COMMONPROGRAMW6432': 'C:\\Program Files\\Common Files',
14:47:50 INFO - 'COMPUTERNAME': 'T-W864-IX-042',
14:47:50 INFO - 'COMSPEC': 'C:\\windows\\system32\\cmd.exe',
14:47:50 INFO - 'DCLOCATION': 'SCL3',
14:47:50 INFO - 'DNSSUFFIX': 'wintest.releng.scl3.mozilla.com',
14:47:50 INFO - 'FP_NO_HOST_CHECK': 'NO',
14:47:50 INFO - 'HOMEDRIVE': 'C:',
14:47:50 INFO - 'HOMEPATH': '\\Users\\cltbld.T-W864-IX-042',
14:47:50 INFO - 'KTS_HOME': 'C:\\Program Files\\KTS',
14:47:50 INFO - 'KTS_VERSION': '1.19c',
14:47:50 INFO - 'LOCALAPPDATA': 'C:\\Users\\cltbld.T-W864-IX-042\\AppData\\Local',
14:47:50 INFO - 'LOGONSERVER': '\\\\T-W864-IX-042',
14:47:50 INFO - 'MONDIR': 'C:\\Monitor_config\\',
14:47:50 INFO - 'MOZBUILDDIR': 'C:\\mozilla-build\\',
14:47:50 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1',
14:47:50 INFO - 'MOZ_NO_REMOTE': '1',
14:47:50 INFO - 'NO_EM_RESTART': '1',
14:47:50 INFO - 'NUMBER_OF_PROCESSORS': '8',
14:47:50 INFO - 'OS': 'Windows_NT',
14:47:50 INFO - 'OURDRIVE': 'C:',
14:47:50 INFO - 'PATH': 'C:\\Program Files (x86)\\NVIDIA Corporation\\PhysX\\Common;C:\\windows\\system32;C:\\windows;C:\\windows\\System32\\Wbem;C:\\windows\\System32\\WindowsPowerShell\\v1.0\\;C:\\mozilla-build\\python27;C:\\mozilla-build\\python27\\Scripts;C:\\mozilla-build\\msys\\bin;C:\\mozilla-build\\vim\\vim72;C:\\mozilla-build\\wget;C:\\mozilla-build\\info-zip;C:\\CoreUtils\\bin;C:\\mozilla-build\\buildbotve\\scripts;C:\\mozilla-build\\hg',
14:47:50 INFO - 'PATHEXT': '.COM;.EXE;.BAT;.CMD;.VBS;.VBE;.JS;.JSE;.WSF;.WSH;.MSC',
14:47:50 INFO - 'PROCESSOR_ARCHITECTURE': 'x86',
14:47:50 INFO - 'PROCESSOR_ARCHITEW6432': 'AMD64',
14:47:50 INFO - 'PROCESSOR_IDENTIFIER': 'Intel64 Family 6 Model 30 Stepping 5, GenuineIntel',
14:47:50 INFO - 'PROCESSOR_LEVEL': '6',
14:47:50 INFO - 'PROCESSOR_REVISION': '1e05',
14:47:50 INFO - 'PROGRAMDATA': 'C:\\ProgramData',
14:47:50 INFO - 'PROGRAMFILES': 'C:\\Program Files (x86)',
14:47:50 INFO - 'PROGRAMFILES(X86)': 'C:\\Program Files (x86)',
14:47:50 INFO - 'PROGRAMW6432': 'C:\\Program Files',
14:47:50 INFO - 'PROMPT': '$P$G',
14:47:50 INFO - 'PROPERTIES_FILE': 'C:\\slave\\test/buildprops.json',
14:47:50 INFO - 'PSMODULEPATH': 'C:\\windows\\system32\\WindowsPowerShell\\v1.0\\Modules\\',
14:47:50 INFO - 'PUBLIC': 'C:\\Users\\Public',
14:47:50 INFO - 'PWD': 'C:\\slave\\test',
14:47:50 INFO - 'RUNLOGFILE': 'C:\\slave\\\\runslave.log',
14:47:50 INFO - 'SLAVEDIR': 'C:\\slave\\',
14:47:50 INFO - 'SYSTEMDRIVE': 'C:',
14:47:50 INFO - 'SYSTEMROOT': 'C:\\windows',
14:47:50 INFO - 'TEMP': 'C:\\Users\\CLTBLD~1.T-W\\AppData\\Local\\Temp',
14:47:50 INFO - 'TEST1': 'testie',
14:47:50 INFO - 'TMP': 'C:\\Users\\CLTBLD~1.T-W\\AppData\\Local\\Temp',
14:47:50 INFO - 'USERDOMAIN': 'T-W864-IX-042',
14:47:50 INFO - 'USERDOMAIN_ROAMINGPROFILE': 'T-W864-IX-042',
14:47:50 INFO - 'USERNAME': 'cltbld',
14:47:50 INFO - 'USERPROFILE': 'C:\\Users\\cltbld.T-W864-IX-042',
14:47:50 INFO - 'WINDIR': 'C:\\windows',
14:47:50 INFO - 'XPCOM_DEBUG_BREAK': 'warn'}
14:47:50 INFO - Ignoring indexes: https://pypi.python.org/simple/
14:47:50 INFO - Unpacking c:\slave\test\build\tests\mozbase\manifestparser
14:47:50 INFO - Running setup.py (path:c:\users\cltbld~1.t-w\appdata\local\temp\pip-ukvbkl-build\setup.py) egg_info for package from file:///C:/slave/test/build/tests/mozbase/manifestparser
14:47:50 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))
14:47:50 INFO - Unpacking c:\slave\test\build\tests\mozbase\mozcrash
14:47:50 INFO - Running setup.py (path:c:\users\cltbld~1.t-w\appdata\local\temp\pip-l6qyc8-build\setup.py) egg_info for package from file:///C:/slave/test/build/tests/mozbase/mozcrash
14:47:51 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash==1.0 from file:///C:/slave/test/build/tests/mozbase/mozcrash in c:\slave\test\build\venv\lib\site-packages (from -r C:\slave\test\build\tests\config\mozbase_requirements.txt (line 2))
14:47:51 INFO - Unpacking c:\slave\test\build\tests\mozbase\mozdebug
14:47:51 INFO - Running setup.py (path:c:\users\cltbld~1.t-w\appdata\local\temp\pip-byaa_q-build\setup.py) egg_info for package from file:///C:/slave/test/build/tests/mozbase/mozdebug
14:47:51 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))
14:47:51 INFO - Unpacking c:\slave\test\build\tests\mozbase\mozdevice
14:47:51 INFO - Running setup.py (path:c:\users\cltbld~1.t-w\appdata\local\temp\pip-n6qqvb-build\setup.py) egg_info for package from file:///C:/slave/test/build/tests/mozbase/mozdevice
14:47:51 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))
14:47:51 INFO - Unpacking c:\slave\test\build\tests\mozbase\mozfile
14:47:51 INFO - Running setup.py (path:c:\users\cltbld~1.t-w\appdata\local\temp\pip-ta8y4w-build\setup.py) egg_info for package from file:///C:/slave/test/build/tests/mozbase/mozfile
14:47:51 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))
14:47:51 INFO - Unpacking c:\slave\test\build\tests\mozbase\mozhttpd
14:47:51 INFO - Running setup.py (path:c:\users\cltbld~1.t-w\appdata\local\temp\pip-0cevvi-build\setup.py) egg_info for package from file:///C:/slave/test/build/tests/mozbase/mozhttpd
14:47:51 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))
14:47:51 INFO - Unpacking c:\slave\test\build\tests\mozbase\mozinfo
14:47:51 INFO - Running setup.py (path:c:\users\cltbld~1.t-w\appdata\local\temp\pip-qurqff-build\setup.py) egg_info for package from file:///C:/slave/test/build/tests/mozbase/mozinfo
14:47:51 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))
14:47:51 INFO - Unpacking c:\slave\test\build\tests\mozbase\mozinstall
14:47:51 INFO - Running setup.py (path:c:\users\cltbld~1.t-w\appdata\local\temp\pip-6oztyl-build\setup.py) egg_info for package from file:///C:/slave/test/build/tests/mozbase/mozinstall
14:47:51 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))
14:47:51 INFO - Unpacking c:\slave\test\build\tests\mozbase\mozleak
14:47:51 INFO - Running setup.py (path:c:\users\cltbld~1.t-w\appdata\local\temp\pip-a8bdhj-build\setup.py) egg_info for package from file:///C:/slave/test/build/tests/mozbase/mozleak
14:47:51 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))
14:47:51 INFO - Unpacking c:\slave\test\build\tests\mozbase\mozlog
14:47:51 INFO - Running setup.py (path:c:\users\cltbld~1.t-w\appdata\local\temp\pip-m9k7ku-build\setup.py) egg_info for package from file:///C:/slave/test/build/tests/mozbase/mozlog
14:47:51 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))
14:47:51 INFO - Unpacking c:\slave\test\build\tests\mozbase\moznetwork
14:47:51 INFO - Running setup.py (path:c:\users\cltbld~1.t-w\appdata\local\temp\pip-vjgtfo-build\setup.py) egg_info for package from file:///C:/slave/test/build/tests/mozbase/moznetwork
14:47:52 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))
14:47:52 INFO - Unpacking c:\slave\test\build\tests\mozbase\mozprocess
14:47:52 INFO - Running setup.py (path:c:\users\cltbld~1.t-w\appdata\local\temp\pip-jfa8ms-build\setup.py) egg_info for package from file:///C:/slave/test/build/tests/mozbase/mozprocess
14:47:52 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))
14:47:52 INFO - Unpacking c:\slave\test\build\tests\mozbase\mozprofile
14:47:52 INFO - Running setup.py (path:c:\users\cltbld~1.t-w\appdata\local\temp\pip-pwbypm-build\setup.py) egg_info for package from file:///C:/slave/test/build/tests/mozbase/mozprofile
14:47:52 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))
14:47:52 INFO - Unpacking c:\slave\test\build\tests\mozbase\mozrunner
14:47:52 INFO - Running setup.py (path:c:\users\cltbld~1.t-w\appdata\local\temp\pip-ciqfk3-build\setup.py) egg_info for package from file:///C:/slave/test/build/tests/mozbase/mozrunner
14:47:52 INFO - Requirement already satisfied (use --upgrade to upgrade): mozrunner==6.13 from file:///C:/slave/test/build/tests/mozbase/mozrunner in c:\slave\test\build\venv\lib\site-packages (from -r C:\slave\test\build\tests\config\mozbase_requirements.txt (line 14))
14:47:52 INFO - Unpacking c:\slave\test\build\tests\mozbase\mozscreenshot
14:47:52 INFO - Running setup.py (path:c:\users\cltbld~1.t-w\appdata\local\temp\pip-d9x3ff-build\setup.py) egg_info for package from file:///C:/slave/test/build/tests/mozbase/mozscreenshot
14:47:52 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))
14:47:52 INFO - Unpacking c:\slave\test\build\tests\mozbase\moztest
14:47:52 INFO - Running setup.py (path:c:\users\cltbld~1.t-w\appdata\local\temp\pip-95rkqa-build\setup.py) egg_info for package from file:///C:/slave/test/build/tests/mozbase/moztest
14:47:52 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))
14:47:52 INFO - Unpacking c:\slave\test\build\tests\mozbase\mozversion
14:47:52 INFO - Running setup.py (path:c:\users\cltbld~1.t-w\appdata\local\temp\pip-koleid-build\setup.py) egg_info for package from file:///C:/slave/test/build/tests/mozbase/mozversion
14:47:52 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))
14:47:52 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.0 in c:\slave\test\build\venv\lib\site-packages (from mozcrash==1.0->-r C:\slave\test\build\tests\config\mozbase_requirements.txt (line 2))
14:47:52 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.0 in c:\slave\test\build\venv\lib\site-packages (from mozcrash==1.0->-r C:\slave\test\build\tests\config\mozbase_requirements.txt (line 2))
14:47:52 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))
14:47:52 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))
14:47:52 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))
14:47:52 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.4->-r C:\slave\test\build\tests\config\mozbase_requirements.txt (line 10))
14:47:52 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
14:47:52 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
14:47:53 INFO - Downloading blessings-1.6.tar.gz
14:47:53 INFO - Running setup.py (path:C:\slave\test\build\venv\build\blessings\setup.py) egg_info for package blessings
14:47:54 INFO - Installing collected packages: blessings
14:47:54 INFO - Running setup.py install for blessings
14:47:54 INFO - Successfully installed blessings
14:47:54 INFO - Cleaning up...
14:47:57 INFO - Return code: 0
14:47:57 INFO - Done creating virtualenv C:\slave\test\build/venv.
14:47:57 INFO - Getting output from command: ['C:\\slave\\test\\build\\venv\\Scripts\\pip', 'freeze']
14:47:57 INFO - Copy/paste: C:\slave\test\build\venv\Scripts\pip freeze
14:47:57 INFO - Reading from file tmpfile_stdout
14:47:57 INFO - Using _rmtree_windows ...
14:47:57 INFO - Using _rmtree_windows ...
14:47:57 INFO - Current package versions:
14:47:57 INFO - blessings == 1.6
14:47:57 INFO - blobuploader == 1.2.4
14:47:57 INFO - docopt == 0.6.1
14:47:57 INFO - functools32 == 3.2.3-2
14:47:57 INFO - jsonschema == 2.5.1
14:47:57 INFO - manifestparser == 1.1
14:47:57 INFO - mozInstall == 1.12
14:47:57 INFO - mozcrash == 1.0
14:47:57 INFO - mozdebug == 0.1
14:47:57 INFO - mozdevice == 0.48
14:47:57 INFO - mozfile == 1.2
14:47:57 INFO - mozhttpd == 0.7
14:47:57 INFO - mozinfo == 0.9
14:47:57 INFO - mozleak == 0.1
14:47:57 INFO - mozlog == 3.4
14:47:57 INFO - moznetwork == 0.27
14:47:57 INFO - mozprocess == 0.23
14:47:57 INFO - mozprofile == 0.28
14:47:57 INFO - mozrunner == 6.13
14:47:57 INFO - mozscreenshot == 0.1
14:47:57 INFO - mozsystemmonitor == 0.3
14:47:57 INFO - moztest == 0.7
14:47:57 INFO - mozversion == 1.4
14:47:57 INFO - psutil == 3.1.1
14:47:57 INFO - requests == 1.2.3
14:47:57 INFO - Installing None into virtualenv C:\slave\test\build/venv
14:47: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')]}
14:47:57 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org
14:47: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')]}
14:47:57 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org
14:47:57 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 0x023EC640>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x0246DE30>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x028751F0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x02448E90>, '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 0x01E6A910>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x028B4520>, '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-042', 'USERDOMAIN': 'T-W864-IX-042', '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-042', 'LOCALAPPDATA': 'C:\\Users\\cltbld.T-W864-IX-042\\AppData\\Local', 'HOMEPATH': '\\Users\\cltbld.T-W864-IX-042', 'USERDOMAIN_ROAMINGPROFILE': 'T-W864-IX-042', 'MOZBUILDDIR': 'C:\\mozilla-build\\', 'PROGRAMW6432': 'C:\\Program Files', 'USERNAME': 'cltbld', 'LOGONSERVER': '\\\\T-W864-IX-042', '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-042\\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
14:47:57 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
14:47:57 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
14:47:57 INFO - Using env: {'ALLUSERSPROFILE': 'C:\\ProgramData',
14:47:57 INFO - 'APPDATA': 'C:\\Users\\cltbld.T-W864-IX-042\\AppData\\Roaming',
14:47:57 INFO - 'COMMONPROGRAMFILES': 'C:\\Program Files (x86)\\Common Files',
14:47:57 INFO - 'COMMONPROGRAMFILES(X86)': 'C:\\Program Files (x86)\\Common Files',
14:47:57 INFO - 'COMMONPROGRAMW6432': 'C:\\Program Files\\Common Files',
14:47:57 INFO - 'COMPUTERNAME': 'T-W864-IX-042',
14:47:57 INFO - 'COMSPEC': 'C:\\windows\\system32\\cmd.exe',
14:47:57 INFO - 'DCLOCATION': 'SCL3',
14:47:57 INFO - 'DNSSUFFIX': 'wintest.releng.scl3.mozilla.com',
14:47:57 INFO - 'FP_NO_HOST_CHECK': 'NO',
14:47:57 INFO - 'HOMEDRIVE': 'C:',
14:47:57 INFO - 'HOMEPATH': '\\Users\\cltbld.T-W864-IX-042',
14:47:57 INFO - 'KTS_HOME': 'C:\\Program Files\\KTS',
14:47:57 INFO - 'KTS_VERSION': '1.19c',
14:47:57 INFO - 'LOCALAPPDATA': 'C:\\Users\\cltbld.T-W864-IX-042\\AppData\\Local',
14:47:57 INFO - 'LOGONSERVER': '\\\\T-W864-IX-042',
14:47:57 INFO - 'MONDIR': 'C:\\Monitor_config\\',
14:47:57 INFO - 'MOZBUILDDIR': 'C:\\mozilla-build\\',
14:47:57 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1',
14:47:57 INFO - 'MOZ_NO_REMOTE': '1',
14:47:57 INFO - 'NO_EM_RESTART': '1',
14:47:57 INFO - 'NUMBER_OF_PROCESSORS': '8',
14:47:57 INFO - 'OS': 'Windows_NT',
14:47:57 INFO - 'OURDRIVE': 'C:',
14:47: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',
14:47:57 INFO - 'PATHEXT': '.COM;.EXE;.BAT;.CMD;.VBS;.VBE;.JS;.JSE;.WSF;.WSH;.MSC',
14:47:57 INFO - 'PROCESSOR_ARCHITECTURE': 'x86',
14:47:57 INFO - 'PROCESSOR_ARCHITEW6432': 'AMD64',
14:47:57 INFO - 'PROCESSOR_IDENTIFIER': 'Intel64 Family 6 Model 30 Stepping 5, GenuineIntel',
14:47:57 INFO - 'PROCESSOR_LEVEL': '6',
14:47:57 INFO - 'PROCESSOR_REVISION': '1e05',
14:47:57 INFO - 'PROGRAMDATA': 'C:\\ProgramData',
14:47:57 INFO - 'PROGRAMFILES': 'C:\\Program Files (x86)',
14:47:57 INFO - 'PROGRAMFILES(X86)': 'C:\\Program Files (x86)',
14:47:57 INFO - 'PROGRAMW6432': 'C:\\Program Files',
14:47:57 INFO - 'PROMPT': '$P$G',
14:47:57 INFO - 'PROPERTIES_FILE': 'C:\\slave\\test/buildprops.json',
14:47:57 INFO - 'PSMODULEPATH': 'C:\\windows\\system32\\WindowsPowerShell\\v1.0\\Modules\\',
14:47:57 INFO - 'PUBLIC': 'C:\\Users\\Public',
14:47:57 INFO - 'PWD': 'C:\\slave\\test',
14:47:57 INFO - 'RUNLOGFILE': 'C:\\slave\\\\runslave.log',
14:47:57 INFO - 'SLAVEDIR': 'C:\\slave\\',
14:47:57 INFO - 'SYSTEMDRIVE': 'C:',
14:47:57 INFO - 'SYSTEMROOT': 'C:\\windows',
14:47:57 INFO - 'TEMP': 'C:\\Users\\CLTBLD~1.T-W\\AppData\\Local\\Temp',
14:47:57 INFO - 'TEST1': 'testie',
14:47:57 INFO - 'TMP': 'C:\\Users\\CLTBLD~1.T-W\\AppData\\Local\\Temp',
14:47:57 INFO - 'USERDOMAIN': 'T-W864-IX-042',
14:47:57 INFO - 'USERDOMAIN_ROAMINGPROFILE': 'T-W864-IX-042',
14:47:57 INFO - 'USERNAME': 'cltbld',
14:47:57 INFO - 'USERPROFILE': 'C:\\Users\\cltbld.T-W864-IX-042',
14:47:57 INFO - 'WINDIR': 'C:\\windows',
14:47:57 INFO - 'XPCOM_DEBUG_BREAK': 'warn'}
14:47:57 INFO - Ignoring indexes: https://pypi.python.org/simple/
14:47:57 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))
14:47:57 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))
14:47:57 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))
14:47:57 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))
14:47:57 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))
14:47:57 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))
14:47:57 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))
14:47:57 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))
14:47:57 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))
14:47:57 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))
14:47:57 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))
14:47:57 INFO - Cleaning up...
14:47:57 INFO - Return code: 0
14:47:57 INFO - Installing jsonschema into virtualenv C:\slave\test\build/venv
14:47: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')]}
14:47:57 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org
14:47: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')]}
14:47:57 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org
14:47: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', 'jsonschema']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x023EC640>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x0246DE30>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x028751F0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x02448E90>, '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 0x01E6A910>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x028B4520>, 'level': 'critical'}], 'cwd': 'C:\\slave\\test\\build', 'env': {'TMP': 'C:\\Users\\CLTBLD~1.T-W\\AppData\\Local\\Temp', 'TEST1': 'testie', 'COMPUTERNAME': 'T-W864-IX-042', 'USERDOMAIN': 'T-W864-IX-042', '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-042', 'LOCALAPPDATA': 'C:\\Users\\cltbld.T-W864-IX-042\\AppData\\Local', 'HOMEPATH': '\\Users\\cltbld.T-W864-IX-042', 'USERDOMAIN_ROAMINGPROFILE': 'T-W864-IX-042', 'MOZBUILDDIR': 'C:\\mozilla-build\\', 'PROGRAMW6432': 'C:\\Program Files', 'USERNAME': 'cltbld', 'LOGONSERVER': '\\\\T-W864-IX-042', '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-042\\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
14:47: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', 'jsonschema'] in C:\slave\test\build
14:47: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 jsonschema
14:47:57 INFO - Using env: {'ALLUSERSPROFILE': 'C:\\ProgramData',
14:47:57 INFO - 'APPDATA': 'C:\\Users\\cltbld.T-W864-IX-042\\AppData\\Roaming',
14:47:57 INFO - 'COMMONPROGRAMFILES': 'C:\\Program Files (x86)\\Common Files',
14:47:57 INFO - 'COMMONPROGRAMFILES(X86)': 'C:\\Program Files (x86)\\Common Files',
14:47:57 INFO - 'COMMONPROGRAMW6432': 'C:\\Program Files\\Common Files',
14:47:57 INFO - 'COMPUTERNAME': 'T-W864-IX-042',
14:47:57 INFO - 'COMSPEC': 'C:\\windows\\system32\\cmd.exe',
14:47:57 INFO - 'DCLOCATION': 'SCL3',
14:47:57 INFO - 'DNSSUFFIX': 'wintest.releng.scl3.mozilla.com',
14:47:57 INFO - 'FP_NO_HOST_CHECK': 'NO',
14:47:57 INFO - 'HOMEDRIVE': 'C:',
14:47:57 INFO - 'HOMEPATH': '\\Users\\cltbld.T-W864-IX-042',
14:47:57 INFO - 'KTS_HOME': 'C:\\Program Files\\KTS',
14:47:57 INFO - 'KTS_VERSION': '1.19c',
14:47:57 INFO - 'LOCALAPPDATA': 'C:\\Users\\cltbld.T-W864-IX-042\\AppData\\Local',
14:47:57 INFO - 'LOGONSERVER': '\\\\T-W864-IX-042',
14:47:57 INFO - 'MONDIR': 'C:\\Monitor_config\\',
14:47:57 INFO - 'MOZBUILDDIR': 'C:\\mozilla-build\\',
14:47:57 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1',
14:47:57 INFO - 'MOZ_NO_REMOTE': '1',
14:47:57 INFO - 'NO_EM_RESTART': '1',
14:47:57 INFO - 'NUMBER_OF_PROCESSORS': '8',
14:47:57 INFO - 'OS': 'Windows_NT',
14:47:57 INFO - 'OURDRIVE': 'C:',
14:47: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',
14:47:57 INFO - 'PATHEXT': '.COM;.EXE;.BAT;.CMD;.VBS;.VBE;.JS;.JSE;.WSF;.WSH;.MSC',
14:47:57 INFO - 'PROCESSOR_ARCHITECTURE': 'x86',
14:47:57 INFO - 'PROCESSOR_ARCHITEW6432': 'AMD64',
14:47:57 INFO - 'PROCESSOR_IDENTIFIER': 'Intel64 Family 6 Model 30 Stepping 5, GenuineIntel',
14:47:57 INFO - 'PROCESSOR_LEVEL': '6',
14:47:57 INFO - 'PROCESSOR_REVISION': '1e05',
14:47:57 INFO - 'PROGRAMDATA': 'C:\\ProgramData',
14:47:57 INFO - 'PROGRAMFILES': 'C:\\Program Files (x86)',
14:47:57 INFO - 'PROGRAMFILES(X86)': 'C:\\Program Files (x86)',
14:47:57 INFO - 'PROGRAMW6432': 'C:\\Program Files',
14:47:57 INFO - 'PROMPT': '$P$G',
14:47:57 INFO - 'PROPERTIES_FILE': 'C:\\slave\\test/buildprops.json',
14:47:57 INFO - 'PSMODULEPATH': 'C:\\windows\\system32\\WindowsPowerShell\\v1.0\\Modules\\',
14:47:57 INFO - 'PUBLIC': 'C:\\Users\\Public',
14:47:57 INFO - 'PWD': 'C:\\slave\\test',
14:47:57 INFO - 'RUNLOGFILE': 'C:\\slave\\\\runslave.log',
14:47:57 INFO - 'SLAVEDIR': 'C:\\slave\\',
14:47:57 INFO - 'SYSTEMDRIVE': 'C:',
14:47:57 INFO - 'SYSTEMROOT': 'C:\\windows',
14:47:57 INFO - 'TEMP': 'C:\\Users\\CLTBLD~1.T-W\\AppData\\Local\\Temp',
14:47:57 INFO - 'TEST1': 'testie',
14:47:57 INFO - 'TMP': 'C:\\Users\\CLTBLD~1.T-W\\AppData\\Local\\Temp',
14:47:57 INFO - 'USERDOMAIN': 'T-W864-IX-042',
14:47:57 INFO - 'USERDOMAIN_ROAMINGPROFILE': 'T-W864-IX-042',
14:47:57 INFO - 'USERNAME': 'cltbld',
14:47:57 INFO - 'USERPROFILE': 'C:\\Users\\cltbld.T-W864-IX-042',
14:47:57 INFO - 'WINDIR': 'C:\\windows',
14:47:57 INFO - 'XPCOM_DEBUG_BREAK': 'warn'}
14:47:58 INFO - Ignoring indexes: https://pypi.python.org/simple/
14:47:58 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in c:\slave\test\build\venv\lib\site-packages
14:47:58 INFO - Cleaning up...
14:47:58 INFO - Return code: 0
14:47:58 INFO - Running post-action listener: _resource_record_post_action
14:47:58 INFO - Running post-action listener: _start_resource_monitoring
14:47:58 INFO - Starting resource monitoring.
14:47:58 INFO - [mozharness: 2016-11-08 22:47:58.389000Z] Finished create-virtualenv step (success)
14:47:58 INFO - [mozharness: 2016-11-08 22:47:58.389000Z] Running install step.
14:47:58 INFO - Running pre-action listener: _resource_record_pre_action
14:47:58 INFO - Running main action method: install
14:47:58 INFO - Getting output from command: ['C:\\slave\\test\\build\\venv\\Scripts\\pip', 'freeze']
14:47:58 INFO - Copy/paste: C:\slave\test\build\venv\Scripts\pip freeze
14:47:58 INFO - Reading from file tmpfile_stdout
14:47:58 INFO - Using _rmtree_windows ...
14:47:58 INFO - Using _rmtree_windows ...
14:47:58 INFO - Detecting whether we're running mozinstall >=1.0...
14:47:58 INFO - Getting output from command: ['C:\\slave\\test\\build/venv/scripts/python', 'C:\\slave\\test\\build/venv/scripts/mozinstall-script.py', '-h']
14:47:58 INFO - Copy/paste: C:\slave\test\build/venv/scripts/python C:\slave\test\build/venv/scripts/mozinstall-script.py -h
14:47:58 INFO - Reading from file tmpfile_stdout
14:47:58 INFO - Output received:
14:47:58 INFO - Usage: mozinstall-script.py [options] installer
14:47:58 INFO - Options:
14:47:58 INFO - -h, --help show this help message and exit
14:47:58 INFO - -d DEST, --destination=DEST
14:47:58 INFO - Directory to install application into. [default:
14:47:58 INFO - "C:\slave\test"]
14:47:58 INFO - --app=APP Application being installed. [default: firefox]
14:47:58 INFO - Using _rmtree_windows ...
14:47:58 INFO - Using _rmtree_windows ...
14:47:58 INFO - mkdir: C:\slave\test\build\application
14:47:58 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']
14:47:58 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
14:48:01 INFO - Reading from file tmpfile_stdout
14:48:01 INFO - Output received:
14:48:01 INFO - C:\slave\test\build\application\firefox\firefox.exe
14:48:01 INFO - Using _rmtree_windows ...
14:48:01 INFO - Using _rmtree_windows ...
14:48:01 INFO - Running post-action listener: _resource_record_post_action
14:48:01 INFO - [mozharness: 2016-11-08 22:48:01.629000Z] Finished install step (success)
14:48:01 INFO - [mozharness: 2016-11-08 22:48:01.629000Z] Running run-tests step.
14:48:01 INFO - Running pre-action listener: _resource_record_pre_action
14:48:01 INFO - Running main action method: run_tests
14:48:01 INFO - Running command: ['C:\\slave\\test\\build\\venv\\Scripts\\python', '--version']
14:48:01 INFO - Copy/paste: C:\slave\test\build\venv\Scripts\python --version
14:48:01 INFO - Python 2.7.3
14:48:01 INFO - Return code: 0
14:48:01 INFO - grabbing minidump binary from tooltool
14:48:01 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]}
14:48:01 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 0x02448E90>, '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 0x01E6A910>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x028B4520>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': 'C:\\slave\\test\\build', 'privileged': False}, attempt #1
14:48:01 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
14:48:01 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
14:48:01 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
14:48:01 INFO - INFO - Attempting to fetch from 'https://api.pub.build.mozilla.org/tooltool/'...
14:48:02 INFO - INFO - File win32-minidump_stackwalk.exe fetched from https://api.pub.build.mozilla.org/tooltool/ as C:\slave\test\build\tmpdr8fnk
14:48:02 INFO - INFO - File integrity verified, renaming tmpdr8fnk to win32-minidump_stackwalk.exe
14:48:02 INFO - Return code: 0
14:48:02 INFO - Chmoding C:\slave\test\build\win32-minidump_stackwalk.exe to 0755
14:48:02 INFO - mkdir: C:\slave\test\build\blobber_upload_dir
14:48:02 INFO - ENV: MOZ_UPLOAD_DIR is now C:\slave\test\build\blobber_upload_dir
14:48:02 INFO - ENV: MINIDUMP_STACKWALK is now C:\slave\test\build\win32-minidump_stackwalk.exe
14:48:02 INFO - ENV: MINIDUMP_SAVE_PATH is now C:\slave\test\build\blobber_upload_dir
14:48:02 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/KNtoCvDQSSq0GlhL-_0P1A/artifacts/public/build/firefox-52.0a1.en-US.win64.crashreporter-symbols.zip', '--title', 'T-W864-IX-042', '--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
14:48:02 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/KNtoCvDQSSq0GlhL-_0P1A/artifacts/public/build/firefox-52.0a1.en-US.win64.crashreporter-symbols.zip --title T-W864-IX-042 --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
14:48:02 INFO - Using env: {'ALLUSERSPROFILE': 'C:\\ProgramData',
14:48:02 INFO - 'APPDATA': 'C:\\Users\\cltbld.T-W864-IX-042\\AppData\\Roaming',
14:48:02 INFO - 'COMMONPROGRAMFILES': 'C:\\Program Files (x86)\\Common Files',
14:48:02 INFO - 'COMMONPROGRAMFILES(X86)': 'C:\\Program Files (x86)\\Common Files',
14:48:02 INFO - 'COMMONPROGRAMW6432': 'C:\\Program Files\\Common Files',
14:48:02 INFO - 'COMPUTERNAME': 'T-W864-IX-042',
14:48:02 INFO - 'COMSPEC': 'C:\\windows\\system32\\cmd.exe',
14:48:02 INFO - 'DCLOCATION': 'SCL3',
14:48:02 INFO - 'DNSSUFFIX': 'wintest.releng.scl3.mozilla.com',
14:48:02 INFO - 'FP_NO_HOST_CHECK': 'NO',
14:48:02 INFO - 'HOMEDRIVE': 'C:',
14:48:02 INFO - 'HOMEPATH': '\\Users\\cltbld.T-W864-IX-042',
14:48:02 INFO - 'KTS_HOME': 'C:\\Program Files\\KTS',
14:48:02 INFO - 'KTS_VERSION': '1.19c',
14:48:02 INFO - 'LOCALAPPDATA': 'C:\\Users\\cltbld.T-W864-IX-042\\AppData\\Local',
14:48:02 INFO - 'LOGONSERVER': '\\\\T-W864-IX-042',
14:48:02 INFO - 'MINIDUMP_SAVE_PATH': 'C:\\slave\\test\\build\\blobber_upload_dir',
14:48:02 INFO - 'MINIDUMP_STACKWALK': 'C:\\slave\\test\\build\\win32-minidump_stackwalk.exe',
14:48:02 INFO - 'MONDIR': 'C:\\Monitor_config\\',
14:48:02 INFO - 'MOZBUILDDIR': 'C:\\mozilla-build\\',
14:48:02 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1',
14:48:02 INFO - 'MOZ_NO_REMOTE': '1',
14:48:02 INFO - 'MOZ_UPLOAD_DIR': 'C:\\slave\\test\\build\\blobber_upload_dir',
14:48:02 INFO - 'NO_EM_RESTART': '1',
14:48:02 INFO - 'NUMBER_OF_PROCESSORS': '8',
14:48:02 INFO - 'OS': 'Windows_NT',
14:48:02 INFO - 'OURDRIVE': 'C:',
14:48: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',
14:48:02 INFO - 'PATHEXT': '.COM;.EXE;.BAT;.CMD;.VBS;.VBE;.JS;.JSE;.WSF;.WSH;.MSC',
14:48:02 INFO - 'PROCESSOR_ARCHITECTURE': 'x86',
14:48:02 INFO - 'PROCESSOR_ARCHITEW6432': 'AMD64',
14:48:02 INFO - 'PROCESSOR_IDENTIFIER': 'Intel64 Family 6 Model 30 Stepping 5, GenuineIntel',
14:48:02 INFO - 'PROCESSOR_LEVEL': '6',
14:48:02 INFO - 'PROCESSOR_REVISION': '1e05',
14:48:02 INFO - 'PROGRAMDATA': 'C:\\ProgramData',
14:48:02 INFO - 'PROGRAMFILES': 'C:\\Program Files (x86)',
14:48:02 INFO - 'PROGRAMFILES(X86)': 'C:\\Program Files (x86)',
14:48:02 INFO - 'PROGRAMW6432': 'C:\\Program Files',
14:48:02 INFO - 'PROMPT': '$P$G',
14:48:02 INFO - 'PROPERTIES_FILE': 'C:\\slave\\test/buildprops.json',
14:48:02 INFO - 'PSMODULEPATH': 'C:\\windows\\system32\\WindowsPowerShell\\v1.0\\Modules\\',
14:48:02 INFO - 'PUBLIC': 'C:\\Users\\Public',
14:48:02 INFO - 'PWD': 'C:\\slave\\test',
14:48:02 INFO - 'PYTHONPATH': 'C:\\slave\\test\\build\\tests\\talos',
14:48:02 INFO - 'RUNLOGFILE': 'C:\\slave\\\\runslave.log',
14:48:02 INFO - 'SLAVEDIR': 'C:\\slave\\',
14:48:02 INFO - 'SYSTEMDRIVE': 'C:',
14:48:02 INFO - 'SYSTEMROOT': 'C:\\windows',
14:48:02 INFO - 'TEMP': 'C:\\Users\\CLTBLD~1.T-W\\AppData\\Local\\Temp',
14:48:02 INFO - 'TEST1': 'testie',
14:48:02 INFO - 'TMP': 'C:\\Users\\CLTBLD~1.T-W\\AppData\\Local\\Temp',
14:48:02 INFO - 'USERDOMAIN': 'T-W864-IX-042',
14:48:02 INFO - 'USERDOMAIN_ROAMINGPROFILE': 'T-W864-IX-042',
14:48:02 INFO - 'USERNAME': 'cltbld',
14:48:02 INFO - 'USERPROFILE': 'C:\\Users\\cltbld.T-W864-IX-042',
14:48:02 INFO - 'WINDIR': 'C:\\windows',
14:48:02 INFO - 'XPCOM_DEBUG_BREAK': 'warn'}
14:48:02 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/KNtoCvDQSSq0GlhL-_0P1A/artifacts/public/build/firefox-52.0a1.en-US.win64.crashreporter-symbols.zip', '--title', 'T-W864-IX-042', '--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
14:48:03 INFO - mozversion application_buildid: 20161108123001
14:48:03 INFO - mozversion application_changeset: d0a3a42979e805db3b896ca786ed61ba85d9a6a7
14:48:03 INFO - mozversion application_display_name: Nightly
14:48:03 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384}
14:48:03 INFO - mozversion application_name: Firefox
14:48:03 INFO - mozversion application_remotingname: firefox
14:48:03 INFO - mozversion application_repository: https://hg.mozilla.org/integration/autoland
14:48:03 INFO - mozversion application_vendor: Mozilla
14:48:03 INFO - mozversion application_version: 52.0a1
14:48:03 INFO - mozversion platform_buildid: 20161108123001
14:48:03 INFO - mozversion platform_changeset: d0a3a42979e805db3b896ca786ed61ba85d9a6a7
14:48:03 INFO - mozversion platform_repository: https://hg.mozilla.org/integration/autoland
14:48:03 INFO - mozversion platform_version: 52.0a1
14:48:03 INFO - using testdate: 1478645283
14:48:03 INFO - actual date: 1478645283
14:48:03 INFO - starting webserver on 'localhost:49273'
14:48:03 INFO - SUITE-START | Running 2 tests
14:48:03 INFO - TEST-START | dromaeo_css
14:48:03 INFO - operating with platform_type : w8_
14:48:03 INFO - Initialising browser for dromaeo_css test...
14:48:03 INFO - TEST-INFO | started process 1508 (C:\slave\test\build\application\firefox\firefox -profile c:\users\cltbld~1.t-w\appdata\local\temp\tmplofufr\profile http://localhost:49273/getInfo.html)
14:48:11 INFO - PROCESS | 1508 | __metrics Screen width/height:1600/1200
14:48:11 INFO - PROCESS | 1508 | colorDepth:24
14:48:11 INFO - PROCESS | 1508 | Browser inner width/height: 1010/674
14:48:11 INFO - PROCESS | 1508 | __metrics
14:48:12 INFO - PROCESS | 1508 | 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"
14:48:12 INFO - PROCESS | 1508 | JavaScript error: resource://app/modules/BrowserUsageTelemetry.jsm, line 211: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver]
14:48:13 INFO - TEST-INFO | 1508: exit 0
14:48:13 INFO - Browser initialized.
14:48:13 INFO - Running cycle 1/1 for dromaeo_css test...
14:48:13 INFO - TEST-INFO | started process 1472 (C:\slave\test\build\application\firefox\firefox -profile c:\users\cltbld~1.t-w\appdata\local\temp\tmplofufr\profile -tp file:\C:\slave\test\build\tests\talos\talos\tests\dromaeo\css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1)
14:48:14 INFO - PROCESS | 1472 | [GFX1-]: Invalid size in UpdateRenderTarget Size(124,0), 0
14:48:25 INFO - PROCESS | 1472 | RSS: Main: 158982144
14:48:25 INFO - PROCESS | 1472 |
14:49:15 INFO - PROCESS | 1472 | 1478645355970 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]
14:51:28 INFO - PROCESS | 1472 | Cycle 1(1): loaded http://localhost:49273/tests/dromaeo/cssquery-dojo.html (next: http://localhost:49273/tests/dromaeo/cssquery-ext.html)
14:51:29 INFO - PROCESS | 1472 | RSS: Main: 247771136
14:51:29 INFO - PROCESS | 1472 |
14:54:32 INFO - PROCESS | 1472 | Cycle 1(1): loaded http://localhost:49273/tests/dromaeo/cssquery-ext.html (next: http://localhost:49273/tests/dromaeo/cssquery-jquery.html)
14:54:33 INFO - PROCESS | 1472 | RSS: Main: 234827776
14:54:33 INFO - PROCESS | 1472 |
14:57:35 INFO - PROCESS | 1472 | Cycle 1(1): loaded http://localhost:49273/tests/dromaeo/cssquery-jquery.html (next: http://localhost:49273/tests/dromaeo/cssquery-mootools.html)
14:57:35 INFO - PROCESS | 1472 | RSS: Main: 193523712
14:57:35 INFO - PROCESS | 1472 |
15:00:37 INFO - PROCESS | 1472 | Cycle 1(1): loaded http://localhost:49273/tests/dromaeo/cssquery-mootools.html (next: http://localhost:49273/tests/dromaeo/cssquery-prototype.html)
15:00:38 INFO - PROCESS | 1472 | RSS: Main: 187158528
15:00:38 INFO - PROCESS | 1472 |
15:03:41 INFO - PROCESS | 1472 | Cycle 1(1): loaded http://localhost:49273/tests/dromaeo/cssquery-prototype.html (next: http://localhost:49273/tests/dromaeo/cssquery-yui.html)
15:03:42 INFO - PROCESS | 1472 | RSS: Main: 171847680
15:03:42 INFO - PROCESS | 1472 |
15:06:44 INFO - PROCESS | 1472 | Cycle 1(1): loaded http://localhost:49273/tests/dromaeo/cssquery-yui.html (next: http://localhost:49273/tests/dromaeo/cssquery-dojo.html)
15:06:45 INFO - PROCESS | 1472 | RSS: Main: 219582464
15:06:45 INFO - PROCESS | 1472 |
15:06:45 INFO - PROCESS | 1472 | __start_tp_report
15:06:45 INFO - PROCESS | 1472 | _x_x_mozilla_page_load
15:06:45 INFO - PROCESS | 1472 | _x_x_mozilla_page_load_details
15:06:45 INFO - PROCESS | 1472 | |i|pagename|runs|
15:06:45 INFO - PROCESS | 1472 | |0;dojo.html;2865.928351791205;2897.391547774967;2911.927201819955;2925.151706005259;2928.502154633712;5201.089809283374;5212.4266330703595;5241.401213829521;5270.446603106676;5320.787168513264;5142.0487209866205;5187.610929180308;5219.921701174476;5228.320318358617;5234.345706786661;4621.214393553088;4669.206234940051;4696.812127514895;4725.763711814413;4780.4741478437345;4751.239801631739;4788.521147885219;4791.089692958344;4800.1119792838435;4807.639427042968;4563.224251877172;4624.676272660899;4640.67515273931;4776.761161941907;4786.856394308176;4626.282926146436;4652.418447694038;4674.789634466457;4675.018246168274;4730.148573256813;4407.691461597689;4541.273396256616;4568.0407114506;4642.79107440166;4654.720716757005;5159.845204643867;5195.740212989335;5216.2958000669805;5223.738813059332;5250;5571.860703482445;5592.664440133564;5603.8879222415735;5615.606907516475;5618.185363122365;5355.866103347447;5439.265699130607;5613.242212301368;5692.373838877762;5701.173329867188;5075.746212689351;5156.123459011939;5191.402988656278;5198.610104242121;5241.921371179359;5720.685362305113;5732.168835518826;5737.340205876378;5753.309602847685;5758.654480731169;5403.270558474555;5486.670799752028;5505.339359276913;5513.751881165357;5557.360903496069;5573.916391254134;5594.776208951596;5643.068893632587;5649.406812284733;5650.463205995424;5558.833235002957;5595.048841696921;5601.6358936668985;5607.831765047055;5609.523190528851;5605.887882242414;5606.355269144101;5608.355039170548;5608.9439105609235;5617.38208797032;3885.630865067814;3890.7471014383973;3897.415387691812;3898.7075969302414;3904.4533765272886;3325.4513005353847;3339.4322965095994;3343.933121337608;3350.9329813404083;3412.8293585320635;5225.268462415265;5256.947430525645;5264.6051546134195;5270.367555893317;5304.469553044742;5450.155225939986;5708.943845388533;5713.514351280188;5719.428057194247;5721.256236689203;5044.621653376012;5122.769475373617;5123.38519377677;5124.231365295235;5125.743712814419;4435.756033418128;4439.955600444019;4454.554544545585;4458.464984201916;4462.152191083684;5609.943900561024;5644.717764111778;5659.8019069333195;5693.715314234271;5784.681842498703;5680.488756011979;5684.886302274014;5687.317521897398;5690.089585666274;5699.829005129853;5653.462921022497;5690.118031705092;5729.942700573108;5733.799317023884;5734.483896449339;5262.158054711228;5330.253764473055;5411.621186516906;5572.944270557243;5573.6098473106495;5620.072688006433;5674.148877668217;5686.2607860977805;5692.43075692444;5749.9712501437225;5492.752826122914;5528.087865502147;5535.059039963136;5538.861528461821;5539;5304.151335786256;5533.142362933751;5534.1975413565615;5538.861528461821;5561.555075594024;5276.129438642581;5321.680699158062;5370.785168593369;5407.459254074561;5426.755795989111;5536.695481748542;5537.529310008534;5538.224648549126;5545.1682247663175;5548.9722551386985;5464.207689885024;5482.150266708507;5482.753276102665;5484.61607687458;5510.669359838423
15:06:45 INFO - PROCESS | 1472 | |1;ext.html;551.0962022283455;553.3829779795527;559.3064599896128;566.9518090962268;568.9573282003851;28000.719992800066;30054.398912021774;30070.248243793914;37264.254714905685;38247.23505529888;38026.23947521048;38153.61846381535;38169.80915095428;38505;38566.228675426544;8187.672493100269;8326.66693332266;8335.416520843513;8350.83298334033;8352.874706879402;7539.623018849035;7694.230576942317;7707.152213256537;8373.539455329954;8427.789305267355;7507.962460187691;7552;9769.218462522982;10131.797364052714;10153.593856245741;9970.202383809314;10033.749156271078;10050.59797608102;10052.045055719731;10059.39643621385;9903.207743380512;9988.550515226832;9992.95003524985;9994.700158995169;9996.550155243032;28675.56986645202;29282.121536353945;29302.41395172106;30369.24076898073;35787.28425431477;2876.669183043956;2952.512835382159;3023.380207057548;3156.700113489238;3396.386292834891;28124.43751124966;28219;28594;28656.713432865614;28979;3967.583403742623;3994.021464741128;4005.6595189408936;4031.113155105872;4040.5555388907196;267423;267958;268536;268989;269362.24885142833;42604.14791704148;43982.3610583366;47778.761106194244;47951.76024119857;48521;50036;50820.49179508157;51360.229596556084;54828.17757733637;55088.86833487504;14568.781468277984;14697;14707;14748.336324865406;14749.41002359915;10590;10628.096611788085;10634.893651063545;10637.414942178255;10642.574297028186;13658.590242292747;14178.503752368617;14832.777508337384;14961.775573366409;14969.877259205603;5039.21892106724;5272.973635131876;5277.340332458442;5363.81995960888;5366.275552800322;756.8788993760971;773.1379511844253;798.5621897730326;852.3181454836106;877.1754550722301;25760.142666072075;26620;26682.5997610036;26697.733022669912;27010.864945675145;915.3501014279802;929.972100836976;937.1893312284825;993.7118235711707;1004.1414590525142;13855.792163117561;13936.163830170222;13950.860491395159;14193.432262709583;14229.50196743109;367552;369379;369434;371106;371894;44852.77573612111;45015.54984450179;45264.54735452603;45732.3140152898;45770;1086.28305318491;1110.5335758981248;1111.4998250787178;1113.7271368514766;1115.983260251097;24776.380590485383;25574;25705.61441578415;25949;26020.21939341823;40810.38784418296;41048;41256.79371603123;41338.1732365345;41359.37960930528;319133.02167446;321655;323293;323533;323934;24018.75981240235;24887;25640.358991025372;25920.092796752022;25933.351666208495;33312;34429.82785086059;38631.80684096562;40181.39727904142;40252.79873600613;33605.663943360254;33718;33955.32089358248;34100.465479053004;34393.732595403395;34612;34733.30533389369;34805.303893922486;34841.651583484854;35116;31640.36719265648;31962.84018579985;33108.83445582853;33140.502892457116;33437.33125337528;26511.623258509633;27383;27775.722242777312;27836.860815695793;28589.857050715444;23277.76722232756;23771.762282376956;23874.505297465275;23991.400214994766;24027
15:06:45 INFO - PROCESS | 1472 | |2;jquery.html;322.67571091053486;348.3398958972747;350.899993501852;351.6044449993757;364.80665247418875;12677.92237659799;15840.445584404548;16000.439984600527;17105.486835394957;17269.568260793487;14632.122072675647;14699.044562103483;14799.33402996865;15176;15191.316390762415;5063.620228482879;5093.108705976458;5302.098643230641;5308.893822123555;5324.281222035033;5126.128558145106;5333.893322133555;5358.169483730028;5365.543928766059;5368.543673787733;5365.570754339663;5424.620276580641;5427.755750991195;5430.67415955042;5431.972840135813;5417.864553386177;5424.83725488236;5432.049391356497;5486.341639003345;5917.674527900964;5290.39160496544;5292.259083728281;5293.682379057269;5296.549793267577;5299.311089558333;10224.642137525225;11514.654560363202;18278.90860545702;18990.62018759617;19907.601847963106;1786.214065811039;1901.4390754727388;2094.057674046685;2475.356407334088;2550.8808743604245;8663.610137543763;8696.565171741451;8931.821363572757;8957.104289571056;9389.812203755955;1731.6536692661518;1780.652772709322;1781.7416474611239;1834.7614810074606;1839.816018398163;67453;68694;69509;70411.295887041;72618.27381726168;9541.809163816684;9654.903450965401;9711.805763884682;9748;9761.609535618638;13011;13056.955443564491;13086.924572725402;13092;13114.344282786013;6970.302969702989;7112;7143.642817859086;7285;7301.671424785897;6693.364130407604;6704.363085506869;6711.261761206263;6792.490563207681;6794.898076528856;3907.9218415631526;3909.7458665186673;3910.589388114264;3946.980265098656;4059.3910913363234;1709.9743503847453;1732.8007279162805;1746.240385432341;1755.2978808476457;1772.7429522719133;765.3265126688478;802.6468353924371;806.2864365036985;844.1052484366469;901.1754244866005;15440.536783896501;15614.609634759221;16132.516024519284;16248.431304904272;16439;764.6788348893479;779.5829231361195;796.6335485676537;801.2948605227363;832.2676045080411;8426;8614.526201059001;8658.913410865936;8670.448263669274;8903.61993890948;375021;396605;399425;399532;401188;66606.00090998638;70914.2908570918;71079.2892071083;71418.64290678513;76036.61981690057;853.8206976534997;882.5587206396673;883.3419102768479;884.4251236696199;885.1016218538189;14104.365303561159;14468.059576127518;14601.196934168298;14633.41466341377;14838.258087095817;33675.15812104619;33709.49435758417;33878;34431.82784086164;35376.646233537336;43774.56225437705;43904.34143487914;45420;45886.11708243657;46271.30593041174;6386.329435409215;6668.533202675766;6742.6628668567355;6753.257141714505;7000.719971201095;8092.797680058045;10459.790804183722;10627.574897004033;10750;10894.182936279969;8785.341099417697;8940.597673104856;9013.774655633662;9100.817983640158;9354.391964522285;8797.868031979653;9043.412178208395;9180.770480737769;9314.813703726024;9353.812923741623;9128.543572821465;9337.533123343941;9369.672061478088;9481.952590237004;9616.9038309616;6719.26088130315;6800.28596997328;6889.621070841152;6897.448074183269;6919.065926099912;8280.50316980983;8988.50563219003;9270.44377337362;9334.813303734023;9403.294752893424
15:06:45 INFO - PROCESS | 1472 | |3;mootools.html;1083.76157245406;1094.430895934114;1102.3716481605488;1203.9157258991872;1377.889768818494;6342.207224096988;7040.119985001875;7212.819679508015;7216.9639151804295;7249.927500724991;7298.854022919539;7325.3773429258445;7349.412047036238;7356.705731770736;7370.078740157481;1921.702136168896;1931.1599454237382;1940.8447324214028;1944.3777991042873;1944.6596845551971;1875.634251320993;1908.6373589018042;1912.6270377276437;1913.8277555020045;1919.3570153998428;1864.822841830024;1876.9718454223198;1886.518937670892;1887.0659023783178;1887.764029496313;1811.5471132216946;1848.3623150013225;1853.7497437845852;1853.749743784592;1855.044652004219;1824.9270029198817;1837.5681714797013;1855.5824939388665;1855.8144185581468;1867.2251015828415;7257.129144502641;7257.455690823156;7285.380742636829;7291.08861392326;7363.889541656879;4096.713230073896;4200.411942328076;4242.236397448458;4245.1934132514725;4287;2650.3771613670774;2759.751622353998;2813.0716863435223;2831.8017738758294;2831.8725657345262;922.7277953003813;927.6614035876923;939.1031564855547;961.9663311784054;964.2527041542791;9981.800363992752;9989.550470228856;10081.739782527184;10101.292909496338;10110.24173187014;3473.2011637323053;3485.128717820545;3556.982215088908;3567.571891373052;3581.516495273157;7751.069871615442;7828;7847.9607601961625;7849.843003139905;7858.410619203468;4129.174165166979;4187.706860519735;4188.434561334242;4191.790410479463;4194.014406614443;3408.556887604645;3561.3767590671528;3930.6855451563806;4021.2761702893176;4028.4964379452567;2832.8441935693736;3084.8766049358223;3123.500239961595;3132.780705350649;3133.7806353555034;892.3758759058451;899.325505870597;906.959186836594;909.9954500227589;910.5674804467825;576.7779404929048;725.4015437264278;751.6692655231681;751.88345806399;781.890535325055;4502.054568540643;4520.593146616755;4585.472670642852;4595.494495605481;4804.543568361;332.1265072858367;334.6385903224512;335.2206120769221;336.0104492270241;336.7844579469142;3120.8127512349333;3203.103131123289;3239.5464634951127;3274.2305558193807;3285.178705323669;8616.750571167146;8782.560871956377;8838.248748856291;8900.955495222483;8905.599248033854;8808.603612837438;8817.338699597556;8823;8840.33697472692;8841.734747957571;6791.626460544619;6970.302969702989;6977.720891164398;6979.89530157048;6980.092587963532;4596.264597664358;4622.399088118523;4632.490426053064;4684;4778.59381952524;8187.385946054189;8258.504489730394;8354.832903342021;8391.874121888055;8393.95803020981;6616.322191332206;8106.675732970615;8267.83464330698;8314.708985185489;8340;6211.565190436807;6439.8068057958335;6581.769638062645;6590.47276217911;6609.867802644017;6915.619640919797;6920.446364290945;6957.339052789976;6963.651817409211;7009.0537777399395;6507.9674601628585;6524.151860258136;6536.346365363425;6558.672066396756;6707.966460167668;6250.249970003629;6408.743650253938;6409.9359006411205;6435.839104022437;6499.772507962199;5661.0659241226385;5662.886742265214;5704.572157088152;5720.313562372542;5737.053386191232;3923.5684074751184;3948.4669569608886;3958.5645578985714;3964.306246406925;4060.167665628598;3621.167131559703;3640.9817950910074;3679.9080022999638;3711.665950064399;3796.677282431024
15:06:45 INFO - PROCESS | 1472 | |4;prototype.html;291.84678044026884;292.7848031696703;295.177929466436;299.53571963456636;299.9100269919024;5219.269302297681;5249.343832020997;5250.396204436495;5251.3698356197265;5261.815836445716;5142.820001299955;5183.429822719498;5212.843614691556;5228.529432351088;5232.502912223342;3736.458213559032;3873.845046198149;3876.9532226298884;3882.669973052294;3947.8618248361313;3911.281659246825;3920.6863450923856;3924.9018774530578;3943.3690609502487;3964.5638979712207;3901.395283731026;3908.433277174808;3918.5885482024264;3921.4706014687936;3956.5054368203973;3666.8899933002053;3720.9813950930206;3786.659200671953;3810.7332486726077;3936.7047471439755;3411.7547095310283;3448.413769659164;3455.3434847378917;3457;3468;5063.493650634907;5074.949250507485;5076.517730815566;5079.187330027215;5088.160453525164;4476.262320962001;4482.596566309048;4542.704724192917;4565.908681826378;4578;5399.811006614789;5409.891802163974;5411.648242864201;5413.670592585571;5418.024755544;3811.9707678926534;3854.5374555053295;3855.402412626019;3864.7777527921558;3865.594112618163;5475.425080366584;5559.777608895639;5598.300212473441;5772.797952071699;5776.97111514444;3841.9423708644395;3846.4230365445405;3849.3255433886347;3863.6715879150024;3864.246471937945;3912.550056743454;3923.8424664723975;3932.5674175840636;3941.231459865356;3947.5262968443394;4341.261985462479;4499.910001799945;4528.50186479487;4535.727856328631;4542.591166795004;5373.731313434391;5382.300300960928;5402.756875940513;5472.835814925558;5483.643563168382;1292.373198998485;1304.3217526886156;1310.8951283897266;1311.554071615636;1311.7769979103575;842.5576572299592;880.5949263338807;889.1775108025051;894.0299774744345;898.9820203595891;4901.877453063702;4923.556879880828;5036.420811606639;5051.1413059779925;5164.328637277205;5569;5571.832845014656;5581.804636837691;5589.35722391922;5591.322603219018;5125.718085505333;5135.589152867761;5148.974255128775;5150.021495915764;5153.582764739652;2719.714429984863;2855.2868279032414;2863.971360286412;2877.0649538899524;2878.7909078187213;5478.863028424321;5486.259354987105;5491;5545.251391062236;5559.416261292587;5381.892362152735;5495.862603434866;5509.752061157257;5561.443855614406;5725.370209276976;5686.317641883001;5691.260136182353;5697.287839020122;5723.828285151452;5727.7422515986045;5677.574181936454;5689.6586204827845;5699.230603868425;5699.230603868425;5700.600957932905;5414.377346605033;5481.0408178567795;5494.36814766307;5503.972480137573;5523.502884740393;5669;5683.692750667287;5719.3136823581435;5720.628159169641;5728.226689396878;3806.3529200035505;3838.4454296010163;3841.519810023747;3845.769353806867;3848.461215429786;5467.371252306036;5596.832095037155;5614.6631202128;5628.774849005994;5650.378458369658;5474;5481.945180548143;5485.807996720256;5508.944910550843;5531.446855314597;5212.270282160424;5364;5508.724563771875;5550.0564903965615;5575.609707320611;5375.650582712111;5382.973085134549;5382.977234325465;5403.540699040625;5422.854744248405;5266.315379000705;5381.085215513451;5399.0281749285505;5493.395726470005;5539.41836107219;5036;5234.685918844729;5327.227552005015;5436.982474726565;5437.483439073281
15:06:45 INFO - PROCESS | 1472 | |5;yui.html;582.2081968522808;608.178958406152;612.412084398977;640.4940097323114;662.8110988368315;12864.614061578155;13646.454141834327;13647.795283070762;13673.794893076587;13678.658033549165;11808.232464889776;11899.572051353827;11932.70168245792;11948.522059117626;11954.342511161904;534.6872079833282;551.8703104770376;615.5998600909422;621.9906701399483;639.8528338482151;623.8845813524513;626.8056902360283;629.5750368501266;630.2437075509384;637.8819918315104;663.2107791727852;663.4460225711513;663.6117871045444;666.9032990216416;667.7128834601144;397.4971660849028;400.2794969055703;404.01622050307594;404.16943181761764;405.25230948899235;476.83549175534387;484.73339663185106;484.9878753031167;485.6551848187791;487.3542556113129;12456.377181140906;12520.93572046368;12524.81212781809;12556.937215313956;12601.36993150348;10492.422916739577;10582.523786429629;10619.84070238947;10766.192535559865;11079.72300692481;10414;11216.66350009501;11243.83134252987;11331.886681133166;11544.653660390202;3857.498525191735;3885.9611403885883;3896.5129358830145;3931.0761970936805;3957.8416863325433;53373.7331313341;55206.72396637991;55207.17189242205;55606.721966390316;55991;8425.789355266044;8713.782155446037;8766.298696104424;9037.50293733851;9456.763580910532;14639.707205855822;14955.40178392852;15124.470643527424;15137.318820653098;15192.848071519144;6912.377885990184;6926.445884329241;6965.164180298397;7015.193252775996;7068.434525237969;3671.2840996006057;3717.423799311111;3734.5518537775097;3808.8666896658483;3811.7331786774657;2634.6048092786236;2716.6875809282187;2722.0744946717814;2722.6460560127057;2724.1418953029734;465.7252221189514;471.6439088488169;473.3633263260909;477.69904959875055;483.86693659243286;570.4894119762789;585.9209006784115;592.7125344208056;599.842304352595;656.8062421585644;8060.476069055492;8153.388495862834;8182.1817818217705;8316.792080198044;8503.404761666749;542.6337222374881;565.7538970547824;568.849254947431;575.6546072356552;578.6904006356663;3856.787876666754;3941.0935484838647;3960.0693836948294;4021.4973128358956;4103.7948102594755;49220;64490;65317.67341163264;67309.32690673128;68793.31206687969;39840;58768.412315876296;59387;61284.38715612876;61404.69297653483;53377.73311133419;54102;54533.182002269205;54854.725726371114;55647.77408903679;7665.923340766744;7765.378769698297;7824.491408058686;7944.841103177789;8053.436259461781;35717.642823571434;36079.81960090183;36123.63876361203;36430.453543196345;38534.80732596319;43477.782611088005;43534.78232608816;45505.54494455145;47165;47528.762356187995;8807.823843523222;8885.244754195966;8935.463872167691;9024.774380640536;9154.450732956044;11193.726919002418;11278.49246783913;11405.600803971822;11481.56480439945;11559.190856639954;8172.795680107807;8275.213854683796;9707.854382184132;10535.253227408142;10833.133349332193;10082.848757268794;10155.39067655943;10301.175905927357;10350.948245258725;10621.522031508755;9972.793318915898;10115.544800484144;10287.897121028695;10600.787984240425;10743.355398676105;8845.867311990454;8877.866831997655;9413.29400294967;9499.905000949902;9517.857232141661;9204;9259.490728010023;9386.577604007973;9429.717108486757;9431.481268530297
15:06:45 INFO - PROCESS | 1472 | __end_tp_report
15:06:45 INFO - PROCESS | 1472 | __start_cc_report
15:06:45 INFO - PROCESS | 1472 | _x_x_mozilla_cycle_collect,1028
15:06:45 INFO - PROCESS | 1472 | __end_cc_report
15:06:45 INFO - PROCESS | 1472 | __startTimestamp1478646405126__endTimestamp
15:06:45 INFO - PROCESS | 1472 |
15:06:45 INFO - PROCESS | 1472 | ------- Summary: start -------
15:06:45 INFO - PROCESS | 1472 | Number of tests: 6
15:06:45 INFO - PROCESS | 1472 |
15:06:45 INFO - PROCESS | 1472 | [#0] dojo.html Cycles:165 Average:5142.21 Median:5403.27 stddev:679.23 (12.6%) stddev-sans-first:657.42
15:06:45 INFO - PROCESS | 1472 | Values: 2865.9 2897.4 2911.9 2925.2 2928.5 5201.1 5212.4 5241.4 5270.4 5320.8 5142.0 5187.6 5219.9 5228.3 5234.3 4621.2 4669.2 4696.8 4725.8 4780.5 4751.2 4788.5 4791.1 4800.1 4807.6 4563.2 4624.7 4640.7 4776.8 4786.9 4626.3 4652.4 4674.8 4675.0 4730.1 4407.7 4541.3 4568.0 4642.8 4654.7 5159.8 5195.7 5216.3 5223.7 5250.0 5571.9 5592.7 5603.9 5615.6 5618.2 5355.9 5439.3 5613.2 5692.4 5701.2 5075.7 5156.1 5191.4 5198.6 5241.9 5720.7 5732.2 5737.3 5753.3 5758.7 5403.3 5486.7 5505.3 5513.8 5557.4 5573.9 5594.8 5643.1 5649.4 5650.5 5558.8 5595.0 5601.6 5607.8 5609.5 5605.9 5606.4 5608.4 5608.9 5617.4 3885.6 3890.7 3897.4 3898.7 3904.5 3325.5 3339.4 3343.9 3350.9 3412.8 5225.3 5256.9 5264.6 5270.4 5304.5 5450.2 5708.9 5713.5 5719.4 5721.3 5044.6 5122.8 5123.4 5124.2 5125.7 4435.8 4440.0 4454.6 4458.5 4462.2 5609.9 5644.7 5659.8 5693.7 5784.7 5680.5 5684.9 5687.3 5690.1 5699.8 5653.5 5690.1 5729.9 5733.8 5734.5 5262.2 5330.3 5411.6 5572.9 5573.6 5620.1 5674.1 5686.3 5692.4 5750.0 5492.8 5528.1 5535.1 5538.9 5539.0 5304.2 5533.1 5534.2 5538.9 5561.6 5276.1 5321.7 5370.8 5407.5 5426.8 5536.7 5537.5 5538.2 5545.2 5549.0 5464.2 5482.2 5482.8 5484.6 5510.7
15:06:45 INFO - PROCESS | 1472 |
15:06:45 INFO - PROCESS | 1472 | [#1] ext.html Cycles:180 Average:46070.15 Median:33836.66 stddev:85004.97 (251.2%) stddev-sans-first:85174.73
15:06:45 INFO - PROCESS | 1472 | Values: 551.1 553.4 559.3 567.0 569.0 28000.7 30054.4 30070.2 37264.3 38247.2 38026.2 38153.6 38169.8 38505.0 38566.2 8187.7 8326.7 8335.4 8350.8 8352.9 7539.6 7694.2 7707.2 8373.5 8427.8 7508.0 7552.0 9769.2 10131.8 10153.6 9970.2 10033.7 10050.6 10052.0 10059.4 9903.2 9988.6 9993.0 9994.7 9996.6 28675.6 29282.1 29302.4 30369.2 35787.3 2876.7 2952.5 3023.4 3156.7 3396.4 28124.4 28219.0 28594.0 28656.7 28979.0 3967.6 3994.0 4005.7 4031.1 4040.6 267423.0 267958.0 268536.0 268989.0 269362.2 42604.1 43982.4 47778.8 47951.8 48521.0 50036.0 50820.5 51360.2 54828.2 55088.9 14568.8 14697.0 14707.0 14748.3 14749.4 10590.0 10628.1 10634.9 10637.4 10642.6 13658.6 14178.5 14832.8 14961.8 14969.9 5039.2 5273.0 5277.3 5363.8 5366.3 756.9 773.1 798.6 852.3 877.2 25760.1 26620.0 26682.6 26697.7 27010.9 915.4 930.0 937.2 993.7 1004.1 13855.8 13936.2 13950.9 14193.4 14229.5 367552.0 369379.0 369434.0 371106.0 371894.0 44852.8 45015.5 45264.5 45732.3 45770.0 1086.3 1110.5 1111.5 1113.7 1116.0 24776.4 25574.0 25705.6 25949.0 26020.2 40810.4 41048.0 41256.8 41338.2 41359.4 319133.0 321655.0 323293.0 323533.0 323934.0 24018.8 24887.0 25640.4 25920.1 25933.4 33312.0 34429.8 38631.8 40181.4 40252.8 33605.7 33718.0 33955.3 34100.5 34393.7 34612.0 34733.3 34805.3 34841.7 35116.0 31640.4 31962.8 33108.8 33140.5 33437.3 26511.6 27383.0 27775.7 27836.9 28589.9 23277.8 23771.8 23874.5 23991.4 24027.0
15:06:45 INFO - PROCESS | 1472 |
15:06:45 INFO - PROCESS | 1472 | [#2] jquery.html Cycles:180 Average:23482.74 Median:5421.24 stddev:65016.80 (1199.3%) stddev-sans-first:65175.94
15:06:45 INFO - PROCESS | 1472 | Values: 322.7 348.3 350.9 351.6 364.8 12677.9 15840.4 16000.4 17105.5 17269.6 14632.1 14699.0 14799.3 15176.0 15191.3 5063.6 5093.1 5302.1 5308.9 5324.3 5126.1 5333.9 5358.2 5365.5 5368.5 5365.6 5424.6 5427.8 5430.7 5432.0 5417.9 5424.8 5432.0 5486.3 5917.7 5290.4 5292.3 5293.7 5296.5 5299.3 10224.6 11514.7 18278.9 18990.6 19907.6 1786.2 1901.4 2094.1 2475.4 2550.9 8663.6 8696.6 8931.8 8957.1 9389.8 1731.7 1780.7 1781.7 1834.8 1839.8 67453.0 68694.0 69509.0 70411.3 72618.3 9541.8 9654.9 9711.8 9748.0 9761.6 13011.0 13057.0 13086.9 13092.0 13114.3 6970.3 7112.0 7143.6 7285.0 7301.7 6693.4 6704.4 6711.3 6792.5 6794.9 3907.9 3909.7 3910.6 3947.0 4059.4 1710.0 1732.8 1746.2 1755.3 1772.7 765.3 802.6 806.3 844.1 901.2 15440.5 15614.6 16132.5 16248.4 16439.0 764.7 779.6 796.6 801.3 832.3 8426.0 8614.5 8658.9 8670.4 8903.6 375021.0 396605.0 399425.0 399532.0 401188.0 66606.0 70914.3 71079.3 71418.6 76036.6 853.8 882.6 883.3 884.4 885.1 14104.4 14468.1 14601.2 14633.4 14838.3 33675.2 33709.5 33878.0 34431.8 35376.6 43774.6 43904.3 45420.0 45886.1 46271.3 6386.3 6668.5 6742.7 6753.3 7000.7 8092.8 10459.8 10627.6 10750.0 10894.2 8785.3 8940.6 9013.8 9100.8 9354.4 8797.9 9043.4 9180.8 9314.8 9353.8 9128.5 9337.5 9369.7 9482.0 9616.9 6719.3 6800.3 6889.6 6897.4 6919.1 8280.5 8988.5 9270.4 9334.8 9403.3
15:06:45 INFO - PROCESS | 1472 |
15:06:45 INFO - PROCESS | 1472 | [#3] mootools.html Cycles:180 Average:4656.73 Median:4731.30 stddev:2718.71 (57.5%) stddev-sans-first:2713.07
15:06:45 INFO - PROCESS | 1472 | Values: 1083.8 1094.4 1102.4 1203.9 1377.9 6342.2 7040.1 7212.8 7217.0 7249.9 7298.9 7325.4 7349.4 7356.7 7370.1 1921.7 1931.2 1940.8 1944.4 1944.7 1875.6 1908.6 1912.6 1913.8 1919.4 1864.8 1877.0 1886.5 1887.1 1887.8 1811.5 1848.4 1853.7 1853.7 1855.0 1824.9 1837.6 1855.6 1855.8 1867.2 7257.1 7257.5 7285.4 7291.1 7363.9 4096.7 4200.4 4242.2 4245.2 4287.0 2650.4 2759.8 2813.1 2831.8 2831.9 922.7 927.7 939.1 962.0 964.3 9981.8 9989.6 10081.7 10101.3 10110.2 3473.2 3485.1 3557.0 3567.6 3581.5 7751.1 7828.0 7848.0 7849.8 7858.4 4129.2 4187.7 4188.4 4191.8 4194.0 3408.6 3561.4 3930.7 4021.3 4028.5 2832.8 3084.9 3123.5 3132.8 3133.8 892.4 899.3 907.0 910.0 910.6 576.8 725.4 751.7 751.9 781.9 4502.1 4520.6 4585.5 4595.5 4804.5 332.1 334.6 335.2 336.0 336.8 3120.8 3203.1 3239.5 3274.2 3285.2 8616.8 8782.6 8838.2 8901.0 8905.6 8808.6 8817.3 8823.0 8840.3 8841.7 6791.6 6970.3 6977.7 6979.9 6980.1 4596.3 4622.4 4632.5 4684.0 4778.6 8187.4 8258.5 8354.8 8391.9 8394.0 6616.3 8106.7 8267.8 8314.7 8340.0 6211.6 6439.8 6581.8 6590.5 6609.9 6915.6 6920.4 6957.3 6963.7 7009.1 6508.0 6524.2 6536.3 6558.7 6708.0 6250.2 6408.7 6409.9 6435.8 6499.8 5661.1 5662.9 5704.6 5720.3 5737.1 3923.6 3948.5 3958.6 3964.3 4060.2 3621.2 3641.0 3679.9 3711.7 3796.7
15:06:45 INFO - PROCESS | 1472 |
15:06:45 INFO - PROCESS | 1472 | [#4] prototype.html Cycles:180 Average:4521.16 Median:5223.90 stddev:1368.58 (26.2%) stddev-sans-first:1335.10
15:06:45 INFO - PROCESS | 1472 | Values: 291.8 292.8 295.2 299.5 299.9 5219.3 5249.3 5250.4 5251.4 5261.8 5142.8 5183.4 5212.8 5228.5 5232.5 3736.5 3873.8 3877.0 3882.7 3947.9 3911.3 3920.7 3924.9 3943.4 3964.6 3901.4 3908.4 3918.6 3921.5 3956.5 3666.9 3721.0 3786.7 3810.7 3936.7 3411.8 3448.4 3455.3 3457.0 3468.0 5063.5 5074.9 5076.5 5079.2 5088.2 4476.3 4482.6 4542.7 4565.9 4578.0 5399.8 5409.9 5411.6 5413.7 5418.0 3812.0 3854.5 3855.4 3864.8 3865.6 5475.4 5559.8 5598.3 5772.8 5777.0 3841.9 3846.4 3849.3 3863.7 3864.2 3912.6 3923.8 3932.6 3941.2 3947.5 4341.3 4499.9 4528.5 4535.7 4542.6 5373.7 5382.3 5402.8 5472.8 5483.6 1292.4 1304.3 1310.9 1311.6 1311.8 842.6 880.6 889.2 894.0 899.0 4901.9 4923.6 5036.4 5051.1 5164.3 5569.0 5571.8 5581.8 5589.4 5591.3 5125.7 5135.6 5149.0 5150.0 5153.6 2719.7 2855.3 2864.0 2877.1 2878.8 5478.9 5486.3 5491.0 5545.3 5559.4 5381.9 5495.9 5509.8 5561.4 5725.4 5686.3 5691.3 5697.3 5723.8 5727.7 5677.6 5689.7 5699.2 5699.2 5700.6 5414.4 5481.0 5494.4 5504.0 5523.5 5669.0 5683.7 5719.3 5720.6 5728.2 3806.4 3838.4 3841.5 3845.8 3848.5 5467.4 5596.8 5614.7 5628.8 5650.4 5474.0 5481.9 5485.8 5508.9 5531.4 5212.3 5364.0 5508.7 5550.1 5575.6 5375.7 5383.0 5383.0 5403.5 5422.9 5266.3 5381.1 5399.0 5493.4 5539.4 5036.0 5234.7 5327.2 5437.0 5437.5
15:06:45 INFO - PROCESS | 1472 |
15:06:45 INFO - PROCESS | 1472 | [#5] yui.html Cycles:180 Average:14054.65 Median:486.50 stddev:17913.46 (3682.1%) stddev-sans-first:17935.15
15:06:45 INFO - PROCESS | 1472 | Values: 582.2 608.2 612.4 640.5 662.8 12864.6 13646.5 13647.8 13673.8 13678.7 11808.2 11899.6 11932.7 11948.5 11954.3 534.7 551.9 615.6 622.0 639.9 623.9 626.8 629.6 630.2 637.9 663.2 663.4 663.6 666.9 667.7 397.5 400.3 404.0 404.2 405.3 476.8 484.7 485.0 485.7 487.4 12456.4 12520.9 12524.8 12556.9 12601.4 10492.4 10582.5 10619.8 10766.2 11079.7 10414.0 11216.7 11243.8 11331.9 11544.7 3857.5 3886.0 3896.5 3931.1 3957.8 53373.7 55206.7 55207.2 55606.7 55991.0 8425.8 8713.8 8766.3 9037.5 9456.8 14639.7 14955.4 15124.5 15137.3 15192.8 6912.4 6926.4 6965.2 7015.2 7068.4 3671.3 3717.4 3734.6 3808.9 3811.7 2634.6 2716.7 2722.1 2722.6 2724.1 465.7 471.6 473.4 477.7 483.9 570.5 585.9 592.7 599.8 656.8 8060.5 8153.4 8182.2 8316.8 8503.4 542.6 565.8 568.8 575.7 578.7 3856.8 3941.1 3960.1 4021.5 4103.8 49220.0 64490.0 65317.7 67309.3 68793.3 39840.0 58768.4 59387.0 61284.4 61404.7 53377.7 54102.0 54533.2 54854.7 55647.8 7665.9 7765.4 7824.5 7944.8 8053.4 35717.6 36079.8 36123.6 36430.5 38534.8 43477.8 43534.8 45505.5 47165.0 47528.8 8807.8 8885.2 8935.5 9024.8 9154.5 11193.7 11278.5 11405.6 11481.6 11559.2 8172.8 8275.2 9707.9 10535.3 10833.1 10082.8 10155.4 10301.2 10350.9 10621.5 9972.8 10115.5 10287.9 10600.8 10743.4 8845.9 8877.9 9413.3 9499.9 9517.9 9204.0 9259.5 9386.6 9429.7 9431.5
15:06:45 INFO - PROCESS | 1472 | -------- Summary: end --------
15:06:45 INFO - PROCESS | 1472 |
15:06:45 INFO - TEST-INFO | 1472: exit 0
15:06:46 INFO - TEST-OK | dromaeo_css | took 1122922ms
15:06:46 INFO - TEST-START | kraken
15:06:46 INFO - operating with platform_type : w8_
15:06:46 INFO - Initialising browser for kraken test...
15:06:46 INFO - TEST-INFO | started process 848 (C:\slave\test\build\application\firefox\firefox -profile c:\users\cltbld~1.t-w\appdata\local\temp\tmpadycdu\profile http://localhost:49273/getInfo.html)
15:06:51 INFO - PROCESS | 848 | __metrics Screen width/height:1600/1200
15:06:51 INFO - PROCESS | 848 | colorDepth:24
15:06:51 INFO - PROCESS | 848 | Browser inner width/height: 1010/674
15:06:51 INFO - PROCESS | 848 | __metrics
15:06:53 INFO - PROCESS | 848 | 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"
15:06:53 INFO - PROCESS | 848 | JavaScript error: resource://app/modules/BrowserUsageTelemetry.jsm, line 211: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver]
15:06:53 INFO - PROCESS | 848 | console.error:
15:06:53 INFO - PROCESS | 848 | Message: Error: Connection closed before committing the transaction.
15:06:53 INFO - PROCESS | 848 | Stack:
15:06:53 INFO - PROCESS | 848 | ConnectionData.prototype<.executeTransaction/promise resource://gre/modules/Promise-backend.js:932:23
15:06:53 INFO - PROCESS | 848 | this.PromiseWalker.walkerLoop@resource://gre/modules/Promise.jsm -> resource://gre/modules/Promise-backend.js:813:7
15:06:53 INFO - PROCESS | 848 | Promise*this.PromiseWalker.scheduleWalkerLoop@resource://gre/modules/Promise.jsm -> resource://gre/modules/Promise-backend.js:744:11
15:06:53 INFO - PROCESS | 848 | this.PromiseWalker.schedulePromise@resource://gre/modules/Promise.jsm -> resource://gre/modules/Promise-backend.js:776:7
15:06:53 INFO - PROCESS | 848 | this.PromiseWalker.completePromise@resource://gre/modules/Promise.jsm -> resource://gre/modules/Promise-backend.js:711:7
15:06:53 INFO - PROCESS | 848 | TaskImpl_run@resource://gre/modules/Task.jsm:324:15
15:06:53 INFO - PROCESS | 848 | Spinner.prototype.observe@resource://gre/modules/AsyncShutdown.jsm:551:9
15:06:53 INFO - PROCESS | 848 | nsAsyncShutdownClient.prototype.addBlocker/moduleBlocker/<@resource://gre/components/nsAsyncShutdown.js:157:15
15:06:53 INFO - PROCESS | 848 | Promise@resource://gre/modules/Promise.jsm -> resource://gre/modules/Promise-backend.js:386:5
15:06:53 INFO - PROCESS | 848 | nsAsyncShutdownClient.prototype.addBlocker/moduleBlocker@resource://gre/components/nsAsyncShutdown.js:153:29
15:06:53 INFO - PROCESS | 848 | Barrier/this.client.addBlocker/promise13.5%
15:07:50 INFO - TinderboxPrint: I/O read bytes / time
297,838,592 / 2,639,400
15:07:50 INFO - TinderboxPrint: I/O write bytes / time
425,292,800 / 3,612,350
15:07:50 INFO - TinderboxPrint: CPU idle
8,244.4 (86.5%)
15:07:50 INFO - TinderboxPrint: CPU user
1,233.0 (12.9%)
15:07:50 INFO - install - Wall time: 3s; CPU: 9.0%; Read bytes: 0; Write bytes: 81707520; Read time: 0; Write time: 167240
15:07:50 INFO - run-tests - Wall time: 1189s; CPU: 13.0%; Read bytes: 297838592; Write bytes: 330117632; Read time: 2639400; Write time: 3433280
15:07:51 INFO - Running post-run listener: _upload_blobber_files
15:07:51 INFO - Blob upload gear active.
15:07:51 INFO - Preparing to upload files from C:\slave\test\build\blobber_upload_dir.
15:07:51 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
15:07:51 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']
15:07:51 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
15:07:51 INFO - (blobuploader) - INFO - Open directory for files ...
15:07:51 INFO - (blobuploader) - INFO - Uploading C:\slave\test\build\blobber_upload_dir\dromaeojs_errorsummary.log ...
15:07:51 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com
15:07:51 INFO - (blobuploader) - INFO - Uploading, attempt #1.
15:07:52 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_errorsummary.log: uploaded
15:07:52 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded!
15:07:52 INFO - (blobuploader) - INFO - Done attempting.
15:07:52 INFO - (blobuploader) - INFO - Uploading C:\slave\test\build\blobber_upload_dir\dromaeojs_raw.log ...
15:07:52 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com
15:07:52 INFO - (blobuploader) - INFO - Uploading, attempt #1.
15:07:53 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_raw.log: uploaded
15:07:53 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded!
15:07:53 INFO - (blobuploader) - INFO - Done attempting.
15:07:53 INFO - (blobuploader) - INFO - Uploading C:\slave\test\build\blobber_upload_dir\resource-usage.json ...
15:07:53 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com
15:07:53 INFO - (blobuploader) - INFO - Uploading, attempt #1.
15:07:55 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded
15:07:55 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded!
15:07:55 INFO - (blobuploader) - INFO - Done attempting.
15:07:55 INFO - (blobuploader) - INFO - Iteration through files over.
15:07:55 INFO - Return code: 0
15:07:55 INFO - rmtree: C:\slave\test\build\uploaded_files.json
15:07:55 INFO - Using _rmtree_windows ...
15:07:55 INFO - retry: Calling _rmtree_windows with args: ('C:\\slave\\test\\build\\uploaded_files.json',), kwargs: {}, attempt #1
15:07:55 INFO - Setting buildbot property blobber_files to {"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland/sha512/6bd15cb6ab6fddd7df5566d3891a118288290be68d4fc8410a61b521a60bebb3957cf356bcf6783ad92acb242b7da77c6145c1737564c38bc8cb0e910fb24770", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland/sha512/a776f3b0636d8af7f3419bc59b17d7b1ae0836b673f3873262615194f341e03040bbfc94ba57b308a343e8e36969dc0028aac6585ed8a4c1ddc20a67a16379de", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland/sha512/552efc07617090247bc0762d979041f55bc4aa22b7bee8695d7a83ec4dcc377af2a82b1f2702d3dde7b70920a43982fd96dda2586758aed06df5bf72f46260bf"}
15:07:55 INFO - Writing buildbot properties ['blobber_files'] to C:\slave\test\properties\blobber_files
15:07:55 INFO - Writing to file C:\slave\test\properties\blobber_files
15:07:55 INFO - Contents:
15:07:55 INFO - blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland/sha512/6bd15cb6ab6fddd7df5566d3891a118288290be68d4fc8410a61b521a60bebb3957cf356bcf6783ad92acb242b7da77c6145c1737564c38bc8cb0e910fb24770", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland/sha512/a776f3b0636d8af7f3419bc59b17d7b1ae0836b673f3873262615194f341e03040bbfc94ba57b308a343e8e36969dc0028aac6585ed8a4c1ddc20a67a16379de", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland/sha512/552efc07617090247bc0762d979041f55bc4aa22b7bee8695d7a83ec4dcc377af2a82b1f2702d3dde7b70920a43982fd96dda2586758aed06df5bf72f46260bf"}
15:07:55 INFO - Running post-run listener: copy_logs_to_upload_dir
15:07:55 INFO - Copying logs to upload dir...
15:07:55 INFO - mkdir: C:\slave\test\build\upload\logs
15:07:55 INFO - Copying logs to upload dir...
15:07:55 INFO - Using _rmtree_windows ...
15:07:55 INFO - Using _rmtree_windows ...
15:07:55 INFO - Using _rmtree_windows ...
15:07:55 INFO - Using _rmtree_windows ...
15:07:55 INFO - Using _rmtree_windows ...
15:07:55 INFO - Using _rmtree_windows ...
15:07:55 INFO - Using _rmtree_windows ...
program finished with exit code 0
elapsedTime=1391.823000
========= master_lag: -0.28 =========
========= Finished 'c:/mozilla-build/python27/python -u ...' (results: 0, elapsed: 23 mins, 11 secs) (at 2016-11-08 15:07:55.845056) =========
========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-11-08 15:07:55.851346) =========
'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-042\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-042
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-042
KTS_HOME=C:\Program Files\KTS
KTS_VERSION=1.19c
LOCALAPPDATA=C:\Users\cltbld.T-W864-IX-042\AppData\Local
LOGONSERVER=\\T-W864-IX-042
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-042
USERDOMAIN_ROAMINGPROFILE=T-W864-IX-042
USERNAME=cltbld
USERPROFILE=C:\Users\cltbld.T-W864-IX-042
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/6bd15cb6ab6fddd7df5566d3891a118288290be68d4fc8410a61b521a60bebb3957cf356bcf6783ad92acb242b7da77c6145c1737564c38bc8cb0e910fb24770", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland/sha512/a776f3b0636d8af7f3419bc59b17d7b1ae0836b673f3873262615194f341e03040bbfc94ba57b308a343e8e36969dc0028aac6585ed8a4c1ddc20a67a16379de", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland/sha512/552efc07617090247bc0762d979041f55bc4aa22b7bee8695d7a83ec4dcc377af2a82b1f2702d3dde7b70920a43982fd96dda2586758aed06df5bf72f46260bf"}
build_url:https://queue.taskcluster.net/v1/task/KNtoCvDQSSq0GlhL-_0P1A/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/KNtoCvDQSSq0GlhL-_0P1A/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/6bd15cb6ab6fddd7df5566d3891a118288290be68d4fc8410a61b521a60bebb3957cf356bcf6783ad92acb242b7da77c6145c1737564c38bc8cb0e910fb24770", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland/sha512/a776f3b0636d8af7f3419bc59b17d7b1ae0836b673f3873262615194f341e03040bbfc94ba57b308a343e8e36969dc0028aac6585ed8a4c1ddc20a67a16379de", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland/sha512/552efc07617090247bc0762d979041f55bc4aa22b7bee8695d7a83ec4dcc377af2a82b1f2702d3dde7b70920a43982fd96dda2586758aed06df5bf72f46260bf"}'
========= master_lag: 0.02 =========
========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-11-08 15:07:55.972148) =========
========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-11-08 15:07:55.972467) =========
'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-042\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-042
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-042
KTS_HOME=C:\Program Files\KTS
KTS_VERSION=1.19c
LOCALAPPDATA=C:\Users\cltbld.T-W864-IX-042\AppData\Local
LOGONSERVER=\\T-W864-IX-042
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-042
USERDOMAIN_ROAMINGPROFILE=T-W864-IX-042
USERNAME=cltbld
USERPROFILE=C:\Users\cltbld.T-W864-IX-042
WINDIR=C:\windows
XPCOM_DEBUG_BREAK=warn
using PTY: False
program finished with exit code 0
elapsedTime=0.101000
========= master_lag: 0.02 =========
========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-11-08 15:07:56.091379) =========
========= Started reboot slave lost (results: 0, elapsed: 0 secs) (at 2016-11-08 15:07:56.091688) =========
========= Finished reboot slave lost (results: 0, elapsed: 0 secs) (at 2016-11-08 15:07:56.499149) =========
========= Total master_lag: -0.06 =========