builder: mozilla-inbound_ubuntu64_hw_test-dromaeojs-pgo slave: talos-linux64-ix-008 starttime: 1458224437.93 results: success (0) buildid: 20160317043016 builduid: 19f01ceb267f42dcb157ac8492aa81e0 revision: 705f2b00c1297fb44c08b38f9443e1a59ad9c001 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-03-17 07:20:37.925458) ========= master: http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-03-17 07:20:37.925885) ========= ========= Started set props: basedir (results: 0, elapsed: 0 secs) (at 2016-03-17 07:20:37.926180) ========= bash -c pwd in dir /builds/slave/test-pgo/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', 'pwd'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test-pgo SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=32c5991c409366f7fec8a718000001d2-1458224437.505172-2111584463 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False /builds/slave/test-pgo program finished with exit code 0 elapsedTime=0.006180 basedir: '/builds/slave/test-pgo' ========= master_lag: 0.02 ========= ========= Finished set props: basedir (results: 0, elapsed: 0 secs) (at 2016-03-17 07:20:37.948446) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-03-17 07:20:37.948728) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-03-17 07:20:37.962144) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-03-17 07:20:37.962421) ========= rm -rf properties in dir /builds/slave/test-pgo/. (timeout 1200 secs) watching logfiles {} argv: ['rm', '-rf', 'properties'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test-pgo SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=32c5991c409366f7fec8a718000001d2-1458224437.505172-2111584463 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004594 ========= master_lag: 0.04 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-03-17 07:20:38.011141) ========= ========= Started set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2016-03-17 07:20:38.011404) ========= script_repo_url: https://hg.mozilla.org/build/mozharness ========= Finished set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2016-03-17 07:20:38.011743) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-03-17 07:20:38.012027) ========= 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 /builds/slave/test-pgo/. (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: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test-pgo SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=32c5991c409366f7fec8a718000001d2-1458224437.505172-2111584463 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2016-03-17 07:20:38-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org (hg.mozilla.org)... 63.245.215.102, 63.245.215.25 Connecting to hg.mozilla.org (hg.mozilla.org)|63.245.215.102|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12141 (12K) [text/x-python] Saving to: `archiver_client.py' 0K .......... . 100% 225M=0s 2016-03-17 07:20:38 (225 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.153382 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-03-17 07:20:38.177336) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-03-17 07:20:38.177642) ========= rm -rf scripts in dir /builds/slave/test-pgo/. (timeout 1200 secs) watching logfiles {} argv: ['rm', '-rf', 'scripts'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test-pgo SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=32c5991c409366f7fec8a718000001d2-1458224437.505172-2111584463 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.022344 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-03-17 07:20:38.226126) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2016-03-17 07:20:38.226437) ========= bash -c 'python archiver_client.py mozharness --repo integration/mozilla-inbound --rev 705f2b00c1297fb44c08b38f9443e1a59ad9c001 --destination scripts --debug' in dir /builds/slave/test-pgo/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', u'python archiver_client.py mozharness --repo integration/mozilla-inbound --rev 705f2b00c1297fb44c08b38f9443e1a59ad9c001 --destination scripts --debug'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test-pgo SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=32c5991c409366f7fec8a718000001d2-1458224437.505172-2111584463 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2016-03-17 07:20:38,464 truncating revision to first 12 chars 2016-03-17 07:20:38,464 Setting DEBUG logging. 2016-03-17 07:20:38,465 attempt 1/10 2016-03-17 07:20:38,465 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/integration/mozilla-inbound/705f2b00c129?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-03-17 07:20:39,380 unpacking tar archive at: mozilla-inbound-705f2b00c129/testing/mozharness/ program finished with exit code 0 elapsedTime=1.216740 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2016-03-17 07:20:39.456006) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-03-17 07:20:39.456380) ========= echo 705f2b00c1297fb44c08b38f9443e1a59ad9c001 in dir /builds/slave/test-pgo/. (timeout 1200 secs) watching logfiles {} argv: ['echo', u'705f2b00c1297fb44c08b38f9443e1a59ad9c001'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test-pgo SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=32c5991c409366f7fec8a718000001d2-1458224437.505172-2111584463 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 705f2b00c1297fb44c08b38f9443e1a59ad9c001 program finished with exit code 0 elapsedTime=0.004196 script_repo_revision: '705f2b00c1297fb44c08b38f9443e1a59ad9c001' ========= master_lag: 0.05 ========= ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-03-17 07:20:39.505846) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-03-17 07:20:39.506120) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-03-17 07:20:39.515914) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 26 secs) (at 2016-03-17 07:20:39.516199) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Mozilla-Inbound --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Mozilla-Inbound in dir /builds/slave/test-pgo/. (timeout 3600 secs) (maxTime 7200 secs) watching logfiles {} argv: ['/tools/buildbot/bin/python', 'scripts/scripts/talos_script.py', '--suite', 'dromaeojs', '--add-option', '--webServer,localhost', '--branch-name', 'Mozilla-Inbound', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Mozilla-Inbound'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PROPERTIES_FILE=/builds/slave/test-pgo/buildprops.json PWD=/builds/slave/test-pgo SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=32c5991c409366f7fec8a718000001d2-1458224437.505172-2111584463 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 07:20:39 INFO - MultiFileLogger online at 20160317 07:20:39 in /builds/slave/test-pgo 07:20:39 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Mozilla-Inbound --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Mozilla-Inbound 07:20:39 INFO - Dumping config to /builds/slave/test-pgo/logs/localconfig.json. 07:20:39 INFO - {'append_to_log': False, 07:20:39 INFO - 'base_work_dir': '/builds/slave/test-pgo', 07:20:39 INFO - 'blob_upload_branch': 'Mozilla-Inbound', 07:20:39 INFO - 'blob_uploader_auth_file': '/builds/slave/test-pgo/oauth.txt', 07:20:39 INFO - 'branch': 'Mozilla-Inbound', 07:20:39 INFO - 'buildbot_json_path': 'buildprops.json', 07:20:39 INFO - 'config_files': ('talos/linux_config.py',), 07:20:39 INFO - 'default_actions': ('clobber', 07:20:39 INFO - 'read-buildbot-config', 07:20:39 INFO - 'download-and-extract', 07:20:39 INFO - 'populate-webroot', 07:20:39 INFO - 'create-virtualenv', 07:20:39 INFO - 'install', 07:20:39 INFO - 'run-tests'), 07:20:39 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 07:20:39 INFO - 'download_minidump_stackwalk': True, 07:20:39 INFO - 'download_symbols': 'ondemand', 07:20:39 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 07:20:39 INFO - 'tooltool.py': '/tools/tooltool.py', 07:20:39 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 07:20:39 INFO - '/tools/misc-python/virtualenv.py')}, 07:20:39 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 07:20:39 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 07:20:39 INFO - 'installer_path': 'installer.exe', 07:20:39 INFO - 'log_level': 'info', 07:20:39 INFO - 'log_name': 'talos', 07:20:39 INFO - 'log_to_console': True, 07:20:39 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 07:20:39 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 07:20:39 INFO - 'opt_config_files': (), 07:20:39 INFO - 'pip_index': False, 07:20:39 INFO - 'sps_profile': False, 07:20:39 INFO - 'sps_profile_interval': 0, 07:20:39 INFO - 'suite': 'dromaeojs', 07:20:39 INFO - 'system_bits': '32', 07:20:39 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 07:20:39 INFO - 'title': 'talos-linux64-ix-008', 07:20:39 INFO - 'tooltool_cache': '/builds/tooltool_cache', 07:20:39 INFO - 'use_talos_json': True, 07:20:39 INFO - 'virtualenv_path': '/builds/slave/test-pgo/build/venv', 07:20:39 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 07:20:39 INFO - 'work_dir': 'build'} 07:20:39 INFO - ##### 07:20:39 INFO - ##### Running clobber step. 07:20:39 INFO - ##### 07:20:39 INFO - Running pre-action listener: _resource_record_pre_action 07:20:39 INFO - Running main action method: clobber 07:20:39 INFO - rmtree: /builds/slave/test-pgo/build 07:20:39 INFO - retry: Calling rmtree with args: ('/builds/slave/test-pgo/build',), kwargs: {}, attempt #1 07:20:40 INFO - Running post-action listener: _resource_record_post_action 07:20:40 INFO - ##### 07:20:40 INFO - ##### Running read-buildbot-config step. 07:20:40 INFO - ##### 07:20:40 INFO - Running pre-action listener: _resource_record_pre_action 07:20:40 INFO - Running main action method: read_buildbot_config 07:20:40 INFO - Using buildbot properties: 07:20:40 INFO - { 07:20:40 INFO - "project": "", 07:20:40 INFO - "product": "firefox", 07:20:40 INFO - "script_repo_revision": "production", 07:20:40 INFO - "builddir": "mozilla-inbound_ubuntu64_hw_test-dromaeojs", 07:20:40 INFO - "repository": "", 07:20:40 INFO - "buildername": "Ubuntu HW 12.04 x64 mozilla-inbound pgo talos dromaeojs", 07:20:40 INFO - "buildid": "20160317043016", 07:20:40 INFO - "pgo_build": "True", 07:20:40 INFO - "basedir": "/builds/slave/test-pgo", 07:20:40 INFO - "buildnumber": 1592, 07:20:40 INFO - "slavename": "talos-linux64-ix-008", 07:20:40 INFO - "master": "http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/", 07:20:40 INFO - "platform": "ubuntu64_hw", 07:20:40 INFO - "scheduler": "tests-mozilla-inbound-linux64-pgo-talos", 07:20:40 INFO - "branch": "mozilla-inbound", 07:20:40 INFO - "repo_path": "integration/mozilla-inbound", 07:20:40 INFO - "revision": "705f2b00c1297fb44c08b38f9443e1a59ad9c001", 07:20:40 INFO - "stage_platform": "linux64-pgo", 07:20:40 INFO - "builduid": "19f01ceb267f42dcb157ac8492aa81e0", 07:20:40 INFO - "slavebuilddir": "test" 07:20:40 INFO - } 07:20:40 INFO - Found installer url https://queue.taskcluster.net/v1/task/YtI84bJLSuynT4NIUW8ViQ/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2. 07:20:40 INFO - Running post-action listener: _resource_record_post_action 07:20:40 INFO - ##### 07:20:40 INFO - ##### Running download-and-extract step. 07:20:40 INFO - ##### 07:20:40 INFO - Running pre-action listener: _resource_record_pre_action 07:20:40 INFO - Running main action method: download_and_extract 07:20:40 INFO - mkdir: /builds/slave/test-pgo/build/tests 07:20:40 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 07:20:40 INFO - https://queue.taskcluster.net/v1/task/YtI84bJLSuynT4NIUW8ViQ/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.test_packages.json matches https://queue.taskcluster.net 07:20:40 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/YtI84bJLSuynT4NIUW8ViQ/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.test_packages.json 07:20:40 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/YtI84bJLSuynT4NIUW8ViQ/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.test_packages.json 07:20:40 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/YtI84bJLSuynT4NIUW8ViQ/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.test_packages.json to /builds/slave/test-pgo/build/firefox-48.0a1.en-US.linux-x86_64.test_packages.json 07:20:40 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/YtI84bJLSuynT4NIUW8ViQ/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.test_packages.json', 'file_name': '/builds/slave/test-pgo/build/firefox-48.0a1.en-US.linux-x86_64.test_packages.json'}, attempt #1 07:20:40 INFO - Downloaded 1361 bytes. 07:20:40 INFO - Reading from file /builds/slave/test-pgo/build/firefox-48.0a1.en-US.linux-x86_64.test_packages.json 07:20:40 INFO - Using the following test package requirements: 07:20:40 INFO - {u'common': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip'], 07:20:40 INFO - u'cppunittest': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 07:20:40 INFO - u'firefox-48.0a1.en-US.linux-x86_64.cppunittest.tests.zip'], 07:20:40 INFO - u'gtest': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 07:20:40 INFO - u'firefox-48.0a1.en-US.linux-x86_64.gtest.tests.zip'], 07:20:40 INFO - u'jittest': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 07:20:40 INFO - u'jsshell-linux-x86_64.zip'], 07:20:40 INFO - u'mochitest': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 07:20:40 INFO - u'firefox-48.0a1.en-US.linux-x86_64.mochitest.tests.zip'], 07:20:40 INFO - u'mozbase': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip'], 07:20:40 INFO - u'reftest': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 07:20:40 INFO - u'firefox-48.0a1.en-US.linux-x86_64.reftest.tests.zip'], 07:20:40 INFO - u'talos': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 07:20:40 INFO - u'firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip'], 07:20:40 INFO - u'web-platform': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 07:20:40 INFO - u'firefox-48.0a1.en-US.linux-x86_64.web-platform.tests.zip'], 07:20:40 INFO - u'xpcshell': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 07:20:40 INFO - u'firefox-48.0a1.en-US.linux-x86_64.xpcshell.tests.zip']} 07:20:40 INFO - Downloading packages: [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 07:20:40 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 07:20:40 INFO - https://queue.taskcluster.net/v1/task/YtI84bJLSuynT4NIUW8ViQ/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 07:20:40 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/YtI84bJLSuynT4NIUW8ViQ/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip 07:20:40 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/YtI84bJLSuynT4NIUW8ViQ/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip 07:20:40 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/YtI84bJLSuynT4NIUW8ViQ/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test-pgo/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip 07:20:40 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/YtI84bJLSuynT4NIUW8ViQ/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test-pgo/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 07:20:42 INFO - Downloaded 23579214 bytes. 07:20:42 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test-pgo/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test-pgo/build/tests'] 07:20:42 INFO - Copy/paste: unzip -q -o /builds/slave/test-pgo/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test-pgo/build/tests 07:20:43 INFO - Return code: 0 07:20:43 INFO - Downloading packages: [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', u'firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip'] for test suite category: talos 07:20:43 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 07:20:43 INFO - https://queue.taskcluster.net/v1/task/YtI84bJLSuynT4NIUW8ViQ/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 07:20:43 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/YtI84bJLSuynT4NIUW8ViQ/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip 07:20:43 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/YtI84bJLSuynT4NIUW8ViQ/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip 07:20:43 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/YtI84bJLSuynT4NIUW8ViQ/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test-pgo/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip 07:20:43 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/YtI84bJLSuynT4NIUW8ViQ/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test-pgo/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 07:20:45 INFO - Downloaded 23579214 bytes. 07:20:45 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test-pgo/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test-pgo/build/tests'] 07:20:45 INFO - Copy/paste: unzip -q -o /builds/slave/test-pgo/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test-pgo/build/tests 07:20:47 INFO - Return code: 0 07:20:47 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 07:20:47 INFO - https://queue.taskcluster.net/v1/task/YtI84bJLSuynT4NIUW8ViQ/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip matches https://queue.taskcluster.net 07:20:47 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/YtI84bJLSuynT4NIUW8ViQ/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip 07:20:47 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/YtI84bJLSuynT4NIUW8ViQ/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip 07:20:47 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/YtI84bJLSuynT4NIUW8ViQ/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip to /builds/slave/test-pgo/build/firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip 07:20:47 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/YtI84bJLSuynT4NIUW8ViQ/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip', 'file_name': u'/builds/slave/test-pgo/build/firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip'}, attempt #1 07:20:48 INFO - Downloaded 10846565 bytes. 07:20:48 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test-pgo/build/firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip', '-d', '/builds/slave/test-pgo/build/tests'] 07:20:48 INFO - Copy/paste: unzip -q -o /builds/slave/test-pgo/build/firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip -d /builds/slave/test-pgo/build/tests 07:20:48 INFO - Return code: 0 07:20:48 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 07:20:48 INFO - https://queue.taskcluster.net/v1/task/YtI84bJLSuynT4NIUW8ViQ/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2 matches https://queue.taskcluster.net 07:20:48 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/YtI84bJLSuynT4NIUW8ViQ/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2 07:20:48 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/YtI84bJLSuynT4NIUW8ViQ/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2 07:20:48 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/YtI84bJLSuynT4NIUW8ViQ/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2 to /builds/slave/test-pgo/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2 07:20:48 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/YtI84bJLSuynT4NIUW8ViQ/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2', 'file_name': '/builds/slave/test-pgo/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2'}, attempt #1 07:20:49 INFO - Downloaded 57696509 bytes. 07:20:49 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/YtI84bJLSuynT4NIUW8ViQ/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2 07:20:49 INFO - mkdir: /builds/slave/test-pgo/properties 07:20:49 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test-pgo/properties/build_url 07:20:49 INFO - Writing to file /builds/slave/test-pgo/properties/build_url 07:20:49 INFO - Contents: 07:20:49 INFO - build_url:https://queue.taskcluster.net/v1/task/YtI84bJLSuynT4NIUW8ViQ/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2 07:20:50 INFO - Running post-action listener: _resource_record_post_action 07:20:50 INFO - Running post-action listener: set_extra_try_arguments 07:20:50 INFO - ##### 07:20:50 INFO - ##### Running populate-webroot step. 07:20:50 INFO - ##### 07:20:50 INFO - Running pre-action listener: _resource_record_pre_action 07:20:50 INFO - Running main action method: populate_webroot 07:20:50 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 07:20:50 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 07:20:50 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 07:20:50 INFO - '--tppagecycles', 07:20:50 INFO - '7'], 07:20:50 INFO - 'tests': ['tsvgm']}}, 07:20:50 INFO - 'suites': {'chromez': {'tests': ['tresize', 'tcanvasmark']}, 07:20:50 INFO - 'chromez-e10s': {'talos_options': ['--e10s'], 07:20:50 INFO - 'tests': ['tresize', 'tcanvasmark']}, 07:20:50 INFO - 'dromaeojs': {'tests': ['dromaeo_css', 'kraken']}, 07:20:50 INFO - 'dromaeojs-e10s': {'talos_options': ['--e10s'], 07:20:50 INFO - 'tests': ['dromaeo_css', 'kraken']}, 07:20:50 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 07:20:50 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 07:20:50 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 07:20:50 INFO - 'talos_options': ['--e10s'], 07:20:50 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 07:20:50 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 07:20:50 INFO - 'tests': ['damp', 'tps']}, 07:20:50 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 07:20:50 INFO - 'talos_options': ['--e10s'], 07:20:50 INFO - 'tests': ['damp', 'tps']}, 07:20:50 INFO - 'g3': {'tests': ['dromaeo_dom']}, 07:20:50 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 07:20:50 INFO - 'other': {'tests': ['a11yr', 07:20:50 INFO - 'ts_paint', 07:20:50 INFO - 'tpaint', 07:20:50 INFO - 'sessionrestore', 07:20:50 INFO - 'sessionrestore_no_auto_restore', 07:20:50 INFO - 'tabpaint']}, 07:20:50 INFO - 'other-e10s': {'talos_options': ['--e10s'], 07:20:50 INFO - 'tests': ['a11yr', 07:20:50 INFO - 'ts_paint', 07:20:50 INFO - 'tpaint', 07:20:50 INFO - 'sessionrestore', 07:20:50 INFO - 'sessionrestore_no_auto_restore', 07:20:50 INFO - 'tabpaint']}, 07:20:50 INFO - 'other-e10s_l64': {'talos_options': ['--e10s'], 07:20:50 INFO - 'tests': ['a11yr', 07:20:50 INFO - 'ts_paint', 07:20:50 INFO - 'tpaint', 07:20:50 INFO - 'sessionrestore', 07:20:50 INFO - 'sessionrestore_no_auto_restore', 07:20:50 INFO - 'tabpaint']}, 07:20:50 INFO - 'other-e10s_nol64': {'talos_options': ['--e10s'], 07:20:50 INFO - 'tests': ['a11yr', 07:20:50 INFO - 'ts_paint', 07:20:50 INFO - 'tpaint', 07:20:50 INFO - 'sessionrestore', 07:20:50 INFO - 'sessionrestore_no_auto_restore', 07:20:50 INFO - 'tabpaint']}, 07:20:50 INFO - 'other_l64': {'tests': ['a11yr', 07:20:50 INFO - 'ts_paint', 07:20:50 INFO - 'tpaint', 07:20:50 INFO - 'sessionrestore', 07:20:50 INFO - 'sessionrestore_no_auto_restore', 07:20:50 INFO - 'tabpaint']}, 07:20:50 INFO - 'other_nol64': {'tests': ['a11yr', 07:20:50 INFO - 'ts_paint', 07:20:50 INFO - 'tpaint', 07:20:50 INFO - 'sessionrestore', 07:20:50 INFO - 'sessionrestore_no_auto_restore', 07:20:50 INFO - 'tabpaint']}, 07:20:50 INFO - 'svgr': {'tests': ['tsvgx', 07:20:50 INFO - 'tsvgr_opacity', 07:20:50 INFO - 'tart', 07:20:50 INFO - 'tscrollx', 07:20:50 INFO - 'cart']}, 07:20:50 INFO - 'svgr-e10s': {'talos_options': ['--e10s'], 07:20:50 INFO - 'tests': ['tsvgx', 07:20:50 INFO - 'tsvgr_opacity', 07:20:50 INFO - 'tart', 07:20:50 INFO - 'tscrollx', 07:20:50 INFO - 'cart']}, 07:20:50 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 07:20:50 INFO - 'tests': ['tp5o']}, 07:20:50 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 07:20:50 INFO - 'talos_options': ['--e10s'], 07:20:50 INFO - 'tests': ['tp5o']}, 07:20:50 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 07:20:50 INFO - 'talos_options': ['--xperf_path', 07:20:50 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 07:20:50 INFO - 'tests': ['tp5n']}, 07:20:50 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 07:20:50 INFO - 'talos_options': ['--e10s', 07:20:50 INFO - '--xperf_path', 07:20:50 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 07:20:50 INFO - 'tests': ['tp5n']}}, 07:20:50 INFO - 'talos.zip': {'path': '', 07:20:50 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 07:20:50 INFO - Running post-action listener: _resource_record_post_action 07:20:50 INFO - ##### 07:20:50 INFO - ##### Running create-virtualenv step. 07:20:50 INFO - ##### 07:20:50 INFO - Running pre-action listener: _resource_record_pre_action 07:20:50 INFO - Running main action method: create_virtualenv 07:20:50 INFO - Creating virtualenv /builds/slave/test-pgo/build/venv 07:20:50 INFO - Running command: ['/tools/buildbot/bin/python', '/tools/misc-python/virtualenv.py', '--no-site-packages', '--distribute', '/builds/slave/test-pgo/build/venv'] in /builds/slave/test-pgo/build 07:20:50 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test-pgo/build/venv 07:20:50 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 07:20:50 INFO - Using real prefix '/usr' 07:20:50 INFO - New python executable in /builds/slave/test-pgo/build/venv/bin/python 07:20:51 INFO - Installing distribute.............................................................................................................................................................................................done. 07:20:53 INFO - Installing pip.................done. 07:20:53 INFO - Return code: 0 07:20:53 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test-pgo/build/venv 07:20:53 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 07:20:53 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 07:20:53 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:20:53 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 07:20:53 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 07:20:53 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:20:53 INFO - retry: Calling run_command with args: [['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--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 0x7fb2f0680f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x12958a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x13618d0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x13f08b0>, '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 0x13f17b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x13f1c60>, 'level': 'critical'}], 'cwd': '/builds/slave/test-pgo/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '32c5991c409366f7fec8a718000001d2-1458224437.505172-2111584463', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test-pgo', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 07:20:53 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5'] in /builds/slave/test-pgo/build 07:20:53 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub pip>=1.5 07:20:53 INFO - Using env: {'DISPLAY': ':0', 07:20:53 INFO - 'HOME': '/home/cltbld', 07:20:53 INFO - 'LANG': 'en_US.UTF-8', 07:20:53 INFO - 'LANGUAGE': 'en_US:en', 07:20:53 INFO - 'LOGNAME': 'cltbld', 07:20:53 INFO - 'MAIL': '/var/mail/cltbld', 07:20:53 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 07:20:53 INFO - 'MOZ_NO_REMOTE': '1', 07:20:53 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 07:20:53 INFO - 'NO_EM_RESTART': '1', 07:20:53 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 07:20:53 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 07:20:53 INFO - 'PWD': '/builds/slave/test-pgo', 07:20:53 INFO - 'SHELL': '/bin/bash', 07:20:53 INFO - 'SHLVL': '1', 07:20:53 INFO - 'TERM': 'linux', 07:20:53 INFO - 'TMOUT': '86400', 07:20:53 INFO - 'USER': 'cltbld', 07:20:53 INFO - 'XDG_SESSION_COOKIE': '32c5991c409366f7fec8a718000001d2-1458224437.505172-2111584463', 07:20:53 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 07:20:53 INFO - '_': '/tools/buildbot/bin/python'} 07:20:53 INFO - Ignoring indexes: https://pypi.python.org/simple/ 07:20:53 INFO - Requirement already satisfied (use --upgrade to upgrade): pip>=1.5 in ./venv/lib/python2.7/site-packages/pip-1.5.5-py2.7.egg 07:20:53 INFO - Cleaning up... 07:20:53 INFO - Return code: 0 07:20:53 INFO - Installing psutil>=0.7.1 into virtualenv /builds/slave/test-pgo/build/venv 07:20:53 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 07:20:53 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 07:20:53 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:20:53 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 07:20:53 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 07:20:53 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:20:53 INFO - retry: Calling run_command with args: [['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=0.7.1']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fb2f0680f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x12958a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x13618d0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x13f08b0>, '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 0x13f17b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x13f1c60>, 'level': 'critical'}], 'cwd': '/builds/slave/test-pgo/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '32c5991c409366f7fec8a718000001d2-1458224437.505172-2111584463', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test-pgo', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 07:20:53 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=0.7.1'] in /builds/slave/test-pgo/build 07:20:53 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub psutil>=0.7.1 07:20:53 INFO - Using env: {'DISPLAY': ':0', 07:20:53 INFO - 'HOME': '/home/cltbld', 07:20:53 INFO - 'LANG': 'en_US.UTF-8', 07:20:53 INFO - 'LANGUAGE': 'en_US:en', 07:20:53 INFO - 'LOGNAME': 'cltbld', 07:20:53 INFO - 'MAIL': '/var/mail/cltbld', 07:20:53 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 07:20:53 INFO - 'MOZ_NO_REMOTE': '1', 07:20:53 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 07:20:53 INFO - 'NO_EM_RESTART': '1', 07:20:53 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 07:20:53 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 07:20:53 INFO - 'PWD': '/builds/slave/test-pgo', 07:20:53 INFO - 'SHELL': '/bin/bash', 07:20:53 INFO - 'SHLVL': '1', 07:20:53 INFO - 'TERM': 'linux', 07:20:53 INFO - 'TMOUT': '86400', 07:20:53 INFO - 'USER': 'cltbld', 07:20:53 INFO - 'XDG_SESSION_COOKIE': '32c5991c409366f7fec8a718000001d2-1458224437.505172-2111584463', 07:20:53 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 07:20:53 INFO - '_': '/tools/buildbot/bin/python'} 07:20:53 INFO - Ignoring indexes: https://pypi.python.org/simple/ 07:20:53 INFO - Downloading/unpacking psutil>=0.7.1 07:20:53 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 07:20:53 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 07:20:53 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:20:53 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:20:53 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 07:20:53 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 07:20:55 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/psutil/setup.py) egg_info for package psutil 07:20:55 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 07:20:55 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 07:20:55 INFO - Installing collected packages: psutil 07:20:55 INFO - Running setup.py install for psutil 07:20:55 INFO - building 'psutil._psutil_linux' extension 07:20:55 INFO - gcc -pthread -fno-strict-aliasing -DNDEBUG -g -fwrapv -O2 -Wall -Wstrict-prototypes -fPIC -DPSUTIL_VERSION=311 -I/usr/include/python2.7 -c psutil/_psutil_linux.c -o build/temp.linux-x86_64-2.7/psutil/_psutil_linux.o 07:20:55 INFO - gcc -pthread -shared -Wl,-O1 -Wl,-Bsymbolic-functions -Wl,-Bsymbolic-functions -Wl,-z,relro build/temp.linux-x86_64-2.7/psutil/_psutil_linux.o -o build/lib.linux-x86_64-2.7/psutil/_psutil_linux.so 07:20:55 INFO - building 'psutil._psutil_posix' extension 07:20:55 INFO - gcc -pthread -fno-strict-aliasing -DNDEBUG -g -fwrapv -O2 -Wall -Wstrict-prototypes -fPIC -I/usr/include/python2.7 -c psutil/_psutil_posix.c -o build/temp.linux-x86_64-2.7/psutil/_psutil_posix.o 07:20:55 INFO - gcc -pthread -shared -Wl,-O1 -Wl,-Bsymbolic-functions -Wl,-Bsymbolic-functions -Wl,-z,relro build/temp.linux-x86_64-2.7/psutil/_psutil_posix.o -o build/lib.linux-x86_64-2.7/psutil/_psutil_posix.so 07:20:55 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 07:20:55 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 07:20:56 INFO - Successfully installed psutil 07:20:56 INFO - Cleaning up... 07:20:56 INFO - Return code: 0 07:20:56 INFO - Installing mozsystemmonitor==0.0.0 into virtualenv /builds/slave/test-pgo/build/venv 07:20:56 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 07:20:56 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 07:20:56 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:20:56 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 07:20:56 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 07:20:56 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:20:56 INFO - retry: Calling run_command with args: [['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.0.0']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fb2f0680f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x12958a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x13618d0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x13f08b0>, '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 0x13f17b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x13f1c60>, 'level': 'critical'}], 'cwd': '/builds/slave/test-pgo/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '32c5991c409366f7fec8a718000001d2-1458224437.505172-2111584463', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test-pgo', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 07:20:56 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.0.0'] in /builds/slave/test-pgo/build 07:20:56 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub mozsystemmonitor==0.0.0 07:20:56 INFO - Using env: {'DISPLAY': ':0', 07:20:56 INFO - 'HOME': '/home/cltbld', 07:20:56 INFO - 'LANG': 'en_US.UTF-8', 07:20:56 INFO - 'LANGUAGE': 'en_US:en', 07:20:56 INFO - 'LOGNAME': 'cltbld', 07:20:56 INFO - 'MAIL': '/var/mail/cltbld', 07:20:56 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 07:20:56 INFO - 'MOZ_NO_REMOTE': '1', 07:20:56 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 07:20:56 INFO - 'NO_EM_RESTART': '1', 07:20:56 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 07:20:56 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 07:20:56 INFO - 'PWD': '/builds/slave/test-pgo', 07:20:56 INFO - 'SHELL': '/bin/bash', 07:20:56 INFO - 'SHLVL': '1', 07:20:56 INFO - 'TERM': 'linux', 07:20:56 INFO - 'TMOUT': '86400', 07:20:56 INFO - 'USER': 'cltbld', 07:20:56 INFO - 'XDG_SESSION_COOKIE': '32c5991c409366f7fec8a718000001d2-1458224437.505172-2111584463', 07:20:56 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 07:20:56 INFO - '_': '/tools/buildbot/bin/python'} 07:20:56 INFO - Ignoring indexes: https://pypi.python.org/simple/ 07:20:56 INFO - Downloading/unpacking mozsystemmonitor==0.0.0 07:20:56 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 07:20:56 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 07:20:56 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:20:56 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:20:56 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 07:20:56 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 07:20:58 INFO - Downloading mozsystemmonitor-0.0.tar.gz 07:20:58 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 07:20:58 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=0.7.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.0.0) 07:20:58 INFO - Installing collected packages: mozsystemmonitor 07:20:58 INFO - Running setup.py install for mozsystemmonitor 07:20:58 INFO - Successfully installed mozsystemmonitor 07:20:58 INFO - Cleaning up... 07:20:58 INFO - Return code: 0 07:20:58 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test-pgo/build/venv 07:20:58 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 07:20:58 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 07:20:58 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:20:58 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 07:20:58 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 07:20:58 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:20:58 INFO - retry: Calling run_command with args: [['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--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 0x7fb2f0680f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x12958a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x13618d0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x13f08b0>, '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 0x13f17b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x13f1c60>, 'level': 'critical'}], 'cwd': '/builds/slave/test-pgo/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '32c5991c409366f7fec8a718000001d2-1458224437.505172-2111584463', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test-pgo', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 07:20:58 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'blobuploader==1.2.4'] in /builds/slave/test-pgo/build 07:20:58 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub blobuploader==1.2.4 07:20:58 INFO - Using env: {'DISPLAY': ':0', 07:20:58 INFO - 'HOME': '/home/cltbld', 07:20:58 INFO - 'LANG': 'en_US.UTF-8', 07:20:58 INFO - 'LANGUAGE': 'en_US:en', 07:20:58 INFO - 'LOGNAME': 'cltbld', 07:20:58 INFO - 'MAIL': '/var/mail/cltbld', 07:20:58 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 07:20:58 INFO - 'MOZ_NO_REMOTE': '1', 07:20:58 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 07:20:58 INFO - 'NO_EM_RESTART': '1', 07:20:58 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 07:20:58 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 07:20:58 INFO - 'PWD': '/builds/slave/test-pgo', 07:20:58 INFO - 'SHELL': '/bin/bash', 07:20:58 INFO - 'SHLVL': '1', 07:20:58 INFO - 'TERM': 'linux', 07:20:58 INFO - 'TMOUT': '86400', 07:20:58 INFO - 'USER': 'cltbld', 07:20:58 INFO - 'XDG_SESSION_COOKIE': '32c5991c409366f7fec8a718000001d2-1458224437.505172-2111584463', 07:20:58 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 07:20:58 INFO - '_': '/tools/buildbot/bin/python'} 07:20:58 INFO - Ignoring indexes: https://pypi.python.org/simple/ 07:20:58 INFO - Downloading/unpacking blobuploader==1.2.4 07:20:58 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 07:20:58 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 07:20:58 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:20:58 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:20:58 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 07:20:58 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 07:21:00 INFO - Downloading blobuploader-1.2.4.tar.gz 07:21:00 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 07:21:00 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 07:21:00 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 07:21:00 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 07:21:00 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:21:00 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:21:00 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 07:21:00 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 07:21:00 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/requests/setup.py) egg_info for package requests 07:21:00 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 07:21:00 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 07:21:00 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 07:21:00 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:21:00 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:21:00 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 07:21:00 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 07:21:01 INFO - Downloading docopt-0.6.1.tar.gz 07:21:01 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/docopt/setup.py) egg_info for package docopt 07:21:01 INFO - Installing collected packages: blobuploader, requests, docopt 07:21:01 INFO - Running setup.py install for blobuploader 07:21:01 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 07:21:01 INFO - changing mode of /builds/slave/test-pgo/build/venv/bin/blobberc.py to 775 07:21:01 INFO - Running setup.py install for requests 07:21:01 INFO - Running setup.py install for docopt 07:21:01 INFO - Successfully installed blobuploader requests docopt 07:21:01 INFO - Cleaning up... 07:21:01 INFO - Return code: 0 07:21:01 INFO - Installing None into virtualenv /builds/slave/test-pgo/build/venv 07:21: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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 07:21:01 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 07:21:01 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:21: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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 07:21:01 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 07:21:01 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:21:01 INFO - retry: Calling run_command with args: [['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--no-deps', '--timeout', '120', '-r', '/builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--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 0x7fb2f0680f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x12958a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x13618d0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x13f08b0>, '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 0x13f17b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x13f1c60>, 'level': 'critical'}], 'cwd': '/builds/slave/test-pgo/build/tests/config', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '32c5991c409366f7fec8a718000001d2-1458224437.505172-2111584463', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test-pgo', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 07:21:01 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--no-deps', '--timeout', '120', '-r', '/builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test-pgo/build/tests/config 07:21:01 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip install --no-deps --timeout 120 -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 07:21:01 INFO - Using env: {'DISPLAY': ':0', 07:21:01 INFO - 'HOME': '/home/cltbld', 07:21:01 INFO - 'LANG': 'en_US.UTF-8', 07:21:01 INFO - 'LANGUAGE': 'en_US:en', 07:21:01 INFO - 'LOGNAME': 'cltbld', 07:21:01 INFO - 'MAIL': '/var/mail/cltbld', 07:21:01 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 07:21:01 INFO - 'MOZ_NO_REMOTE': '1', 07:21:01 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 07:21:01 INFO - 'NO_EM_RESTART': '1', 07:21:01 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 07:21:01 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 07:21:01 INFO - 'PWD': '/builds/slave/test-pgo', 07:21:01 INFO - 'SHELL': '/bin/bash', 07:21:01 INFO - 'SHLVL': '1', 07:21:01 INFO - 'TERM': 'linux', 07:21:01 INFO - 'TMOUT': '86400', 07:21:01 INFO - 'USER': 'cltbld', 07:21:01 INFO - 'XDG_SESSION_COOKIE': '32c5991c409366f7fec8a718000001d2-1458224437.505172-2111584463', 07:21:01 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 07:21:01 INFO - '_': '/tools/buildbot/bin/python'} 07:21:01 INFO - Ignoring indexes: https://pypi.python.org/simple/ 07:21:01 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/manifestparser 07:21:01 INFO - Running setup.py (path:/tmp/pip-o4IISx-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/manifestparser 07:21:02 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozcrash 07:21:02 INFO - Running setup.py (path:/tmp/pip-56hVAe-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozcrash 07:21:02 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdebug 07:21:02 INFO - Running setup.py (path:/tmp/pip-9IaNUw-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdebug 07:21:02 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdevice 07:21:02 INFO - Running setup.py (path:/tmp/pip-NXe5TH-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdevice 07:21:02 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozfile 07:21:02 INFO - Running setup.py (path:/tmp/pip-9sHe_D-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozfile 07:21:02 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozhttpd 07:21:02 INFO - Running setup.py (path:/tmp/pip-Yp9Xln-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozhttpd 07:21:02 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinfo 07:21:02 INFO - Running setup.py (path:/tmp/pip-OcXBfy-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinfo 07:21:02 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinstall 07:21:02 INFO - Running setup.py (path:/tmp/pip-2PlOFw-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinstall 07:21:02 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozleak 07:21:02 INFO - Running setup.py (path:/tmp/pip-ZSJ8EF-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozleak 07:21:02 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozlog 07:21:02 INFO - Running setup.py (path:/tmp/pip-Lgipj7-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozlog 07:21:02 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moznetwork 07:21:02 INFO - Running setup.py (path:/tmp/pip-r_HWmi-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moznetwork 07:21:02 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprocess 07:21:02 INFO - Running setup.py (path:/tmp/pip-eYBKJw-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprocess 07:21:02 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprofile 07:21:02 INFO - Running setup.py (path:/tmp/pip-xqHWk8-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprofile 07:21:02 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozrunner 07:21:02 INFO - Running setup.py (path:/tmp/pip-sAX31L-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozrunner 07:21:02 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 07:21:02 INFO - Running setup.py (path:/tmp/pip-XJhjnV-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 07:21:03 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moztest 07:21:03 INFO - Running setup.py (path:/tmp/pip-u6efJt-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moztest 07:21:03 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozversion 07:21:03 INFO - Running setup.py (path:/tmp/pip-Z5nuJl-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozversion 07:21:03 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 07:21:03 INFO - Running setup.py install for manifestparser 07:21:03 INFO - Installing manifestparser script to /builds/slave/test-pgo/build/venv/bin 07:21:03 INFO - Running setup.py install for mozcrash 07:21:03 INFO - Running setup.py install for mozdebug 07:21:03 INFO - Running setup.py install for mozdevice 07:21:03 INFO - Installing sutini script to /builds/slave/test-pgo/build/venv/bin 07:21:03 INFO - Installing dm script to /builds/slave/test-pgo/build/venv/bin 07:21:03 INFO - Running setup.py install for mozfile 07:21:03 INFO - Running setup.py install for mozhttpd 07:21:03 INFO - Installing mozhttpd script to /builds/slave/test-pgo/build/venv/bin 07:21:03 INFO - Running setup.py install for mozinfo 07:21:03 INFO - Installing mozinfo script to /builds/slave/test-pgo/build/venv/bin 07:21:03 INFO - Running setup.py install for mozInstall 07:21:03 INFO - Installing moz_remove_from_system script to /builds/slave/test-pgo/build/venv/bin 07:21:03 INFO - Installing mozuninstall script to /builds/slave/test-pgo/build/venv/bin 07:21:03 INFO - Installing mozinstall script to /builds/slave/test-pgo/build/venv/bin 07:21:03 INFO - Installing moz_add_to_system script to /builds/slave/test-pgo/build/venv/bin 07:21:04 INFO - Running setup.py install for mozleak 07:21:04 INFO - Running setup.py install for mozlog 07:21:04 INFO - Installing structlog script to /builds/slave/test-pgo/build/venv/bin 07:21:04 INFO - Running setup.py install for moznetwork 07:21:04 INFO - Installing moznetwork script to /builds/slave/test-pgo/build/venv/bin 07:21:04 INFO - Running setup.py install for mozprocess 07:21:04 INFO - Running setup.py install for mozprofile 07:21:04 INFO - Installing mozprofile script to /builds/slave/test-pgo/build/venv/bin 07:21:04 INFO - Installing diff-profiles script to /builds/slave/test-pgo/build/venv/bin 07:21:04 INFO - Installing view-profile script to /builds/slave/test-pgo/build/venv/bin 07:21:04 INFO - Running setup.py install for mozrunner 07:21:04 INFO - Installing mozrunner script to /builds/slave/test-pgo/build/venv/bin 07:21:04 INFO - Running setup.py install for mozscreenshot 07:21:04 INFO - Running setup.py install for moztest 07:21:04 INFO - Running setup.py install for mozversion 07:21:04 INFO - Installing mozversion script to /builds/slave/test-pgo/build/venv/bin 07:21:04 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 07:21:04 INFO - Cleaning up... 07:21:04 INFO - Return code: 0 07:21:04 INFO - Installing None into virtualenv /builds/slave/test-pgo/build/venv 07:21: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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 07:21:04 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 07:21:04 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:21: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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 07:21:04 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 07:21:04 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:21:04 INFO - retry: Calling run_command with args: [['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--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 0x7fb2f0680f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x12958a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x13618d0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x13f08b0>, '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 0x13f17b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x13f1c60>, 'level': 'critical'}], 'cwd': '/builds/slave/test-pgo/build/tests/config', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '32c5991c409366f7fec8a718000001d2-1458224437.505172-2111584463', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test-pgo', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 07:21:04 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test-pgo/build/tests/config 07:21:04 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip install --timeout 120 -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 07:21:05 INFO - Using env: {'DISPLAY': ':0', 07:21:05 INFO - 'HOME': '/home/cltbld', 07:21:05 INFO - 'LANG': 'en_US.UTF-8', 07:21:05 INFO - 'LANGUAGE': 'en_US:en', 07:21:05 INFO - 'LOGNAME': 'cltbld', 07:21:05 INFO - 'MAIL': '/var/mail/cltbld', 07:21:05 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 07:21:05 INFO - 'MOZ_NO_REMOTE': '1', 07:21:05 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 07:21:05 INFO - 'NO_EM_RESTART': '1', 07:21:05 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 07:21:05 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 07:21:05 INFO - 'PWD': '/builds/slave/test-pgo', 07:21:05 INFO - 'SHELL': '/bin/bash', 07:21:05 INFO - 'SHLVL': '1', 07:21:05 INFO - 'TERM': 'linux', 07:21:05 INFO - 'TMOUT': '86400', 07:21:05 INFO - 'USER': 'cltbld', 07:21:05 INFO - 'XDG_SESSION_COOKIE': '32c5991c409366f7fec8a718000001d2-1458224437.505172-2111584463', 07:21:05 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 07:21:05 INFO - '_': '/tools/buildbot/bin/python'} 07:21:05 INFO - Ignoring indexes: https://pypi.python.org/simple/ 07:21:05 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/manifestparser 07:21:05 INFO - Running setup.py (path:/tmp/pip-bchkhj-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/manifestparser 07:21:05 INFO - Requirement already satisfied (use --upgrade to upgrade): manifestparser==1.1 from file:///builds/slave/test-pgo/build/tests/mozbase/manifestparser in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 1)) 07:21:05 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozcrash 07:21:05 INFO - Running setup.py (path:/tmp/pip-HOEJYP-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozcrash 07:21:05 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash==0.17 from file:///builds/slave/test-pgo/build/tests/mozbase/mozcrash in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 2)) 07:21:05 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdebug 07:21:05 INFO - Running setup.py (path:/tmp/pip-JaTBKO-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdebug 07:21:05 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdebug==0.1 from file:///builds/slave/test-pgo/build/tests/mozbase/mozdebug in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 3)) 07:21:05 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdevice 07:21:05 INFO - Running setup.py (path:/tmp/pip-DzicmD-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdevice 07:21:05 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdevice==0.48 from file:///builds/slave/test-pgo/build/tests/mozbase/mozdevice in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 4)) 07:21:05 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozfile 07:21:05 INFO - Running setup.py (path:/tmp/pip-CzKFjk-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozfile 07:21:05 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile==1.2 from file:///builds/slave/test-pgo/build/tests/mozbase/mozfile in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 5)) 07:21:05 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozhttpd 07:21:05 INFO - Running setup.py (path:/tmp/pip-X5vvWd-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozhttpd 07:21:05 INFO - Requirement already satisfied (use --upgrade to upgrade): mozhttpd==0.7 from file:///builds/slave/test-pgo/build/tests/mozbase/mozhttpd in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 6)) 07:21:05 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinfo 07:21:05 INFO - Running setup.py (path:/tmp/pip-wkGWOK-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinfo 07:21:05 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo==0.9 from file:///builds/slave/test-pgo/build/tests/mozbase/mozinfo in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 7)) 07:21:05 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinstall 07:21:05 INFO - Running setup.py (path:/tmp/pip-5KLmke-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinstall 07:21:05 INFO - Requirement already satisfied (use --upgrade to upgrade): mozInstall==1.12 from file:///builds/slave/test-pgo/build/tests/mozbase/mozinstall in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 8)) 07:21:05 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozleak 07:21:05 INFO - Running setup.py (path:/tmp/pip-CFok46-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozleak 07:21:05 INFO - Requirement already satisfied (use --upgrade to upgrade): mozleak==0.1 from file:///builds/slave/test-pgo/build/tests/mozbase/mozleak in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 9)) 07:21:05 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozlog 07:21:05 INFO - Running setup.py (path:/tmp/pip-3MzGxy-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozlog 07:21:05 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog==3.1 from file:///builds/slave/test-pgo/build/tests/mozbase/mozlog in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 10)) 07:21:05 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moznetwork 07:21:05 INFO - Running setup.py (path:/tmp/pip-AGhPFq-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moznetwork 07:21:06 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork==0.27 from file:///builds/slave/test-pgo/build/tests/mozbase/moznetwork in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 11)) 07:21:06 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprocess 07:21:06 INFO - Running setup.py (path:/tmp/pip-J0wRA2-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprocess 07:21:06 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess==0.22 from file:///builds/slave/test-pgo/build/tests/mozbase/mozprocess in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 12)) 07:21:06 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprofile 07:21:06 INFO - Running setup.py (path:/tmp/pip-VplkQK-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprofile 07:21:06 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile==0.28 from file:///builds/slave/test-pgo/build/tests/mozbase/mozprofile in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 13)) 07:21:06 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozrunner 07:21:06 INFO - Running setup.py (path:/tmp/pip-mivhlT-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozrunner 07:21:06 INFO - Requirement already satisfied (use --upgrade to upgrade): mozrunner==6.11 from file:///builds/slave/test-pgo/build/tests/mozbase/mozrunner in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 14)) 07:21:06 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 07:21:06 INFO - Running setup.py (path:/tmp/pip-1sHnUN-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 07:21:06 INFO - Requirement already satisfied (use --upgrade to upgrade): mozscreenshot==0.1 from file:///builds/slave/test-pgo/build/tests/mozbase/mozscreenshot in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 15)) 07:21:06 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moztest 07:21:06 INFO - Running setup.py (path:/tmp/pip-i7GR71-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moztest 07:21:06 INFO - Requirement already satisfied (use --upgrade to upgrade): moztest==0.7 from file:///builds/slave/test-pgo/build/tests/mozbase/moztest in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 16)) 07:21:06 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozversion 07:21:06 INFO - Running setup.py (path:/tmp/pip-MYpDGR-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozversion 07:21:06 INFO - Requirement already satisfied (use --upgrade to upgrade): mozversion==1.4 from file:///builds/slave/test-pgo/build/tests/mozbase/mozversion in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 17)) 07:21:06 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.0 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from mozcrash==0.17->-r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 2)) 07:21:06 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.0 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from mozcrash==0.17->-r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 2)) 07:21:06 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from mozdebug==0.1->-r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 3)) 07:21:06 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from mozdevice==0.48->-r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 4)) 07:21:06 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.19 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from mozdevice==0.48->-r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 4)) 07:21:06 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.1->-r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 10)) 07:21:06 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 07:21:06 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 07:21:06 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:21:06 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:21:06 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 07:21:06 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 07:21:08 INFO - Downloading blessings-1.6.tar.gz 07:21:08 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/blessings/setup.py) egg_info for package blessings 07:21:08 INFO - Installing collected packages: blessings 07:21:08 INFO - Running setup.py install for blessings 07:21:08 INFO - Successfully installed blessings 07:21:08 INFO - Cleaning up... 07:21:08 INFO - Return code: 0 07:21:08 INFO - Done creating virtualenv /builds/slave/test-pgo/build/venv. 07:21:08 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'freeze'] 07:21:08 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip freeze 07:21:08 INFO - Reading from file tmpfile_stdout 07:21:08 INFO - Current package versions: 07:21:08 INFO - argparse == 1.2.1 07:21:08 INFO - blessings == 1.6 07:21:08 INFO - blobuploader == 1.2.4 07:21:08 INFO - docopt == 0.6.1 07:21:08 INFO - manifestparser == 1.1 07:21:08 INFO - mozInstall == 1.12 07:21:08 INFO - mozcrash == 0.17 07:21:08 INFO - mozdebug == 0.1 07:21:08 INFO - mozdevice == 0.48 07:21:08 INFO - mozfile == 1.2 07:21:08 INFO - mozhttpd == 0.7 07:21:08 INFO - mozinfo == 0.9 07:21:08 INFO - mozleak == 0.1 07:21:08 INFO - mozlog == 3.1 07:21:08 INFO - moznetwork == 0.27 07:21:08 INFO - mozprocess == 0.22 07:21:08 INFO - mozprofile == 0.28 07:21:08 INFO - mozrunner == 6.11 07:21:08 INFO - mozscreenshot == 0.1 07:21:08 INFO - mozsystemmonitor == 0.0 07:21:08 INFO - moztest == 0.7 07:21:08 INFO - mozversion == 1.4 07:21:08 INFO - psutil == 3.1.1 07:21:08 INFO - requests == 1.2.3 07:21:08 INFO - wsgiref == 0.1.2 07:21:08 INFO - Installing None into virtualenv /builds/slave/test-pgo/build/venv 07:21:08 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 07:21:08 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 07:21:08 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:21:08 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 07:21:08 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 07:21:08 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:21:08 INFO - retry: Calling run_command with args: [['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test-pgo/build/tests/talos/requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--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 0x7fb2f0680f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x12958a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x13618d0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x13f08b0>, '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 0x13f17b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x13f1c60>, 'level': 'critical'}], 'cwd': '/builds/slave/test-pgo/build/tests/talos', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '32c5991c409366f7fec8a718000001d2-1458224437.505172-2111584463', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test-pgo', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 07:21:08 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test-pgo/build/tests/talos/requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test-pgo/build/tests/talos 07:21:08 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip install --timeout 120 -r /builds/slave/test-pgo/build/tests/talos/requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 07:21:08 INFO - Using env: {'DISPLAY': ':0', 07:21:08 INFO - 'HOME': '/home/cltbld', 07:21:08 INFO - 'LANG': 'en_US.UTF-8', 07:21:08 INFO - 'LANGUAGE': 'en_US:en', 07:21:08 INFO - 'LOGNAME': 'cltbld', 07:21:08 INFO - 'MAIL': '/var/mail/cltbld', 07:21:08 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 07:21:08 INFO - 'MOZ_NO_REMOTE': '1', 07:21:08 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 07:21:08 INFO - 'NO_EM_RESTART': '1', 07:21:08 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 07:21:08 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 07:21:08 INFO - 'PWD': '/builds/slave/test-pgo', 07:21:08 INFO - 'SHELL': '/bin/bash', 07:21:08 INFO - 'SHLVL': '1', 07:21:08 INFO - 'TERM': 'linux', 07:21:08 INFO - 'TMOUT': '86400', 07:21:08 INFO - 'USER': 'cltbld', 07:21:08 INFO - 'XDG_SESSION_COOKIE': '32c5991c409366f7fec8a718000001d2-1458224437.505172-2111584463', 07:21:08 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 07:21:08 INFO - '_': '/tools/buildbot/bin/python'} 07:21:08 INFO - Ignoring indexes: https://pypi.python.org/simple/ 07:21:08 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.1 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/talos/requirements.txt (line 1)) 07:21:08 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash>=0.15 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/talos/requirements.txt (line 2)) 07:21:08 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.2 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/talos/requirements.txt (line 3)) 07:21:08 INFO - Requirement already satisfied (use --upgrade to upgrade): mozhttpd>=0.7 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/talos/requirements.txt (line 4)) 07:21:08 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo>=0.8 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/talos/requirements.txt (line 5)) 07:21:08 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.22 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/talos/requirements.txt (line 6)) 07:21:08 INFO - Requirement already satisfied (use --upgrade to upgrade): mozversion>=1.3 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/talos/requirements.txt (line 7)) 07:21:08 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile>=0.25 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/talos/requirements.txt (line 8)) 07:21:08 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/talos/requirements.txt (line 9)) 07:21:08 INFO - Requirement already satisfied (use --upgrade to upgrade): blessings>=1.3 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from mozlog>=3.1->-r /builds/slave/test-pgo/build/tests/talos/requirements.txt (line 1)) 07:21:08 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from mozhttpd>=0.7->-r /builds/slave/test-pgo/build/tests/talos/requirements.txt (line 4)) 07:21:08 INFO - Cleaning up... 07:21:08 INFO - Return code: 0 07:21:08 INFO - Installing jsonschema into virtualenv /builds/slave/test-pgo/build/venv 07:21:08 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 07:21:08 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 07:21:08 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:21:08 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 07:21:08 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 07:21:08 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:21:08 INFO - retry: Calling run_command with args: [['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--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 0x7fb2f0680f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x12958a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x13618d0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x13f08b0>, '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 0x13f17b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x13f1c60>, 'level': 'critical'}], 'cwd': '/builds/slave/test-pgo/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '32c5991c409366f7fec8a718000001d2-1458224437.505172-2111584463', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test-pgo', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 07:21:08 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema'] in /builds/slave/test-pgo/build 07:21:08 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema 07:21:08 INFO - Using env: {'DISPLAY': ':0', 07:21:08 INFO - 'HOME': '/home/cltbld', 07:21:08 INFO - 'LANG': 'en_US.UTF-8', 07:21:08 INFO - 'LANGUAGE': 'en_US:en', 07:21:08 INFO - 'LOGNAME': 'cltbld', 07:21:08 INFO - 'MAIL': '/var/mail/cltbld', 07:21:08 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 07:21:08 INFO - 'MOZ_NO_REMOTE': '1', 07:21:08 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 07:21:08 INFO - 'NO_EM_RESTART': '1', 07:21:08 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 07:21:08 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 07:21:08 INFO - 'PWD': '/builds/slave/test-pgo', 07:21:08 INFO - 'SHELL': '/bin/bash', 07:21:08 INFO - 'SHLVL': '1', 07:21:08 INFO - 'TERM': 'linux', 07:21:08 INFO - 'TMOUT': '86400', 07:21:08 INFO - 'USER': 'cltbld', 07:21:08 INFO - 'XDG_SESSION_COOKIE': '32c5991c409366f7fec8a718000001d2-1458224437.505172-2111584463', 07:21:08 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 07:21:08 INFO - '_': '/tools/buildbot/bin/python'} 07:21:09 INFO - Ignoring indexes: https://pypi.python.org/simple/ 07:21:09 INFO - Downloading/unpacking jsonschema 07:21:09 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 07:21:09 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 07:21:09 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:21:09 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:21:09 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 07:21:09 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 07:21:11 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 07:21:11 INFO - Downloading/unpacking functools32 (from jsonschema) 07:21:11 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 07:21:11 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 07:21:11 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:21:11 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:21:11 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 07:21:11 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 07:21:11 INFO - Downloading functools32-3.2.3-2.tar.gz 07:21:11 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/functools32/setup.py) egg_info for package functools32 07:21:11 INFO - warning: no files found matching '*.txt' 07:21:11 INFO - no previously-included directories found matching 'build' 07:21:11 INFO - no previously-included directories found matching 'dist' 07:21:11 INFO - no previously-included directories found matching '.git*' 07:21:11 INFO - Installing collected packages: jsonschema, functools32 07:21:11 INFO - Running setup.py install for functools32 07:21:11 INFO - warning: no files found matching '*.txt' 07:21:11 INFO - no previously-included directories found matching 'build' 07:21:11 INFO - no previously-included directories found matching 'dist' 07:21:11 INFO - no previously-included directories found matching '.git*' 07:21:11 INFO - Successfully installed jsonschema functools32 07:21:11 INFO - Cleaning up... 07:21:11 INFO - Return code: 0 07:21:11 INFO - Installing flake8 into virtualenv /builds/slave/test-pgo/build/venv 07:21:11 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 07:21:11 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 07:21:11 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:21:11 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 07:21:11 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 07:21:11 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:21:11 INFO - retry: Calling run_command with args: [['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'flake8']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fb2f0680f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x12958a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x13618d0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x13f08b0>, '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 0x13f17b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x13f1c60>, 'level': 'critical'}], 'cwd': '/builds/slave/test-pgo/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '32c5991c409366f7fec8a718000001d2-1458224437.505172-2111584463', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test-pgo', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 07:21:11 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'flake8'] in /builds/slave/test-pgo/build 07:21:11 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub flake8 07:21:11 INFO - Using env: {'DISPLAY': ':0', 07:21:11 INFO - 'HOME': '/home/cltbld', 07:21:11 INFO - 'LANG': 'en_US.UTF-8', 07:21:11 INFO - 'LANGUAGE': 'en_US:en', 07:21:11 INFO - 'LOGNAME': 'cltbld', 07:21:11 INFO - 'MAIL': '/var/mail/cltbld', 07:21:11 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 07:21:11 INFO - 'MOZ_NO_REMOTE': '1', 07:21:11 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 07:21:11 INFO - 'NO_EM_RESTART': '1', 07:21:11 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 07:21:11 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 07:21:11 INFO - 'PWD': '/builds/slave/test-pgo', 07:21:11 INFO - 'SHELL': '/bin/bash', 07:21:11 INFO - 'SHLVL': '1', 07:21:11 INFO - 'TERM': 'linux', 07:21:11 INFO - 'TMOUT': '86400', 07:21:11 INFO - 'USER': 'cltbld', 07:21:11 INFO - 'XDG_SESSION_COOKIE': '32c5991c409366f7fec8a718000001d2-1458224437.505172-2111584463', 07:21:11 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 07:21:11 INFO - '_': '/tools/buildbot/bin/python'} 07:21:11 INFO - Ignoring indexes: https://pypi.python.org/simple/ 07:21:11 INFO - Downloading/unpacking flake8 07:21:11 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 07:21:11 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 07:21:11 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:21:11 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:21:11 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 07:21:11 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 07:21:13 INFO - Downloading flake8-2.5.0-py2.py3-none-any.whl 07:21:13 INFO - Downloading/unpacking mccabe>=0.2.1,<0.4 (from flake8) 07:21:13 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 07:21:13 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 07:21:13 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:21:13 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:21:13 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 07:21:13 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 07:21:13 INFO - Downloading mccabe-0.3.1-py2.py3-none-any.whl 07:21:13 INFO - Downloading/unpacking pyflakes>=0.8.1,<1.1 (from flake8) 07:21:13 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 07:21:13 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 07:21:13 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:21:13 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:21:13 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 07:21:13 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 07:21:14 INFO - Downloading/unpacking pep8>=1.5.7,!=1.6.0,!=1.6.1,!=1.6.2 (from flake8) 07:21:14 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 07:21:14 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 07:21:14 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:21:14 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:21:14 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 07:21:14 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 07:21:14 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/pep8/setup.py) egg_info for package pep8 07:21:14 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 07:21:14 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 07:21:14 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 07:21:14 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 07:21:14 INFO - no previously-included directories found matching 'docs/_build' 07:21:14 INFO - Installing collected packages: flake8, mccabe, pyflakes, pep8 07:21:14 INFO - Running setup.py install for pep8 07:21:14 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 07:21:14 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 07:21:14 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 07:21:14 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 07:21:14 INFO - no previously-included directories found matching 'docs/_build' 07:21:14 INFO - Installing pep8 script to /builds/slave/test-pgo/build/venv/bin 07:21:14 INFO - Successfully installed flake8 mccabe pyflakes pep8 07:21:14 INFO - Cleaning up... 07:21:14 INFO - Return code: 0 07:21:14 INFO - Running post-action listener: _resource_record_post_action 07:21:14 INFO - Running post-action listener: _start_resource_monitoring 07:21:14 INFO - Starting resource monitoring. 07:21:14 INFO - ##### 07:21:14 INFO - ##### Running install step. 07:21:14 INFO - ##### 07:21:14 INFO - Running pre-action listener: _resource_record_pre_action 07:21:14 INFO - Running main action method: install 07:21:14 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'freeze'] 07:21:14 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip freeze 07:21:14 INFO - Reading from file tmpfile_stdout 07:21:14 INFO - Detecting whether we're running mozinstall >=1.0... 07:21:14 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/mozinstall', '-h'] 07:21:14 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/mozinstall -h 07:21:15 INFO - Reading from file tmpfile_stdout 07:21:15 INFO - Output received: 07:21:15 INFO - Usage: mozinstall [options] installer 07:21:15 INFO - Options: 07:21:15 INFO - -h, --help show this help message and exit 07:21:15 INFO - -d DEST, --destination=DEST 07:21:15 INFO - Directory to install application into. [default: 07:21:15 INFO - "/builds/slave/test-pgo"] 07:21:15 INFO - --app=APP Application being installed. [default: firefox] 07:21:15 INFO - mkdir: /builds/slave/test-pgo/build/application 07:21:15 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/mozinstall', '/builds/slave/test-pgo/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2', '--destination', '/builds/slave/test-pgo/build/application'] 07:21:15 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/mozinstall /builds/slave/test-pgo/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2 --destination /builds/slave/test-pgo/build/application 07:21:31 INFO - Reading from file tmpfile_stdout 07:21:31 INFO - Output received: 07:21:31 INFO - /builds/slave/test-pgo/build/application/firefox/firefox 07:21:31 INFO - Running post-action listener: _resource_record_post_action 07:21:31 INFO - ##### 07:21:31 INFO - ##### Running run-tests step. 07:21:31 INFO - ##### 07:21:31 INFO - Running pre-action listener: _resource_record_pre_action 07:21:31 INFO - Running main action method: run_tests 07:21:31 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/python', '--version'] 07:21:31 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/python --version 07:21:31 INFO - Python 2.7.3 07:21:31 INFO - Return code: 0 07:21:31 INFO - grabbing minidump binary from tooltool 07:21:31 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 07:21:31 INFO - retry: Calling run_command with args: (['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test-pgo/build/tests/config/tooltool-manifests/linux64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'],), kwargs: {'error_list': [{'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x13f08b0>, '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 0x13f17b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x13f1c60>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test-pgo/build', 'privileged': False}, attempt #1 07:21:31 INFO - Running command: ['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test-pgo/build/tests/config/tooltool-manifests/linux64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'] in /builds/slave/test-pgo/build 07:21:31 INFO - Copy/paste: /tools/tooltool.py --url https://api.pub.build.mozilla.org/tooltool/ --authentication-file /builds/relengapi.tok fetch -m /builds/slave/test-pgo/build/tests/config/tooltool-manifests/linux64/releng.manifest -o -c /builds/tooltool_cache 07:21:31 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 07:21:31 INFO - Return code: 0 07:21:31 INFO - Chmoding /builds/slave/test-pgo/build/linux64-minidump_stackwalk to 0755 07:21:31 INFO - mkdir: /builds/slave/test-pgo/build/blobber_upload_dir 07:21:31 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test-pgo/build/blobber_upload_dir 07:21:31 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test-pgo/build/linux64-minidump_stackwalk 07:21:31 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test-pgo/build/blobber_upload_dir 07:21:31 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/flake8', '/builds/slave/test-pgo/build/tests/talos/talos'] 07:21:31 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/flake8 /builds/slave/test-pgo/build/tests/talos/talos 07:21:32 INFO - Return code: 0 07:21:32 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/python', '/builds/slave/test-pgo/build/tests/talos/talos/run_tests.py', '--branchName', 'Mozilla-Inbound', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test-pgo/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/YtI84bJLSuynT4NIUW8ViQ/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-008', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs_errorsummary.log', '--log-raw=/builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs_raw.log'] in /builds/slave/test-pgo/build 07:21:32 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/python /builds/slave/test-pgo/build/tests/talos/talos/run_tests.py --branchName Mozilla-Inbound --suite dromaeojs --executablePath /builds/slave/test-pgo/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/YtI84bJLSuynT4NIUW8ViQ/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-008 --webServer localhost --log-tbpl-level=debug --log-errorsummary=/builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs_errorsummary.log --log-raw=/builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs_raw.log 07:21:32 INFO - Using env: {'DISPLAY': ':0', 07:21:32 INFO - 'HOME': '/home/cltbld', 07:21:32 INFO - 'LANG': 'en_US.UTF-8', 07:21:32 INFO - 'LANGUAGE': 'en_US:en', 07:21:32 INFO - 'LOGNAME': 'cltbld', 07:21:32 INFO - 'MAIL': '/var/mail/cltbld', 07:21:32 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test-pgo/build/blobber_upload_dir', 07:21:32 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test-pgo/build/linux64-minidump_stackwalk', 07:21:32 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 07:21:32 INFO - 'MOZ_NO_REMOTE': '1', 07:21:32 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test-pgo/build/blobber_upload_dir', 07:21:32 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 07:21:32 INFO - 'NO_EM_RESTART': '1', 07:21:32 INFO - 'PATH': '/builds/slave/test-pgo/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 07:21:32 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 07:21:32 INFO - 'PWD': '/builds/slave/test-pgo', 07:21:32 INFO - 'PYTHONPATH': '/builds/slave/test-pgo/build/tests/talos', 07:21:32 INFO - 'SHELL': '/bin/bash', 07:21:32 INFO - 'SHLVL': '1', 07:21:32 INFO - 'TERM': 'linux', 07:21:32 INFO - 'TMOUT': '86400', 07:21:32 INFO - 'USER': 'cltbld', 07:21:32 INFO - 'XDG_SESSION_COOKIE': '32c5991c409366f7fec8a718000001d2-1458224437.505172-2111584463', 07:21:32 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 07:21:32 INFO - '_': '/tools/buildbot/bin/python'} 07:21:32 INFO - Calling ['/builds/slave/test-pgo/build/venv/bin/python', '/builds/slave/test-pgo/build/tests/talos/talos/run_tests.py', '--branchName', 'Mozilla-Inbound', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test-pgo/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/YtI84bJLSuynT4NIUW8ViQ/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-008', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs_errorsummary.log', '--log-raw=/builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs_raw.log'] with output_timeout 3600 07:21:32 INFO - mozversion application_buildid: 20160317043016 07:21:32 INFO - mozversion application_changeset: 705f2b00c1297fb44c08b38f9443e1a59ad9c001 07:21:32 INFO - mozversion application_display_name: Nightly 07:21:32 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 07:21:32 INFO - mozversion application_name: Firefox 07:21:32 INFO - mozversion application_remotingname: firefox 07:21:32 INFO - mozversion application_repository: https://hg.mozilla.org/integration/mozilla-inbound 07:21:32 INFO - mozversion application_vendor: Mozilla 07:21:32 INFO - mozversion application_version: 48.0a1 07:21:32 INFO - mozversion platform_buildid: 20160317043016 07:21:32 INFO - mozversion platform_changeset: 705f2b00c1297fb44c08b38f9443e1a59ad9c001 07:21:32 INFO - mozversion platform_repository: https://hg.mozilla.org/integration/mozilla-inbound 07:21:32 INFO - mozversion platform_version: 48.0a1 07:21:32 INFO - using testdate: 1458224492 07:21:32 INFO - actual date: 1458224492 07:21:32 INFO - starting webserver on 'localhost:43716' 07:21:32 INFO - SUITE-START | Running 2 tests 07:21:32 INFO - TEST-START | dromaeo_css 07:21:32 INFO - operating with platform_type : linux_ 07:21:32 INFO - Initialising browser for dromaeo_css test... 07:21:32 INFO - TEST-INFO | started process 9860 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpx4NHAs/profile http://localhost:43716/getInfo.html) 07:21:36 INFO - PROCESS | 9860 | __metrics Screen width/height:1600/1200 07:21:36 INFO - PROCESS | 9860 | colorDepth:24 07:21:36 INFO - PROCESS | 9860 | Browser inner width/height: 1024/697 07:21:36 INFO - PROCESS | 9860 | __metrics 07:21:37 ERROR - PROCESS | 9860 | JavaScript error: resource://app/modules/AboutNewTab.jsm, line 36: TypeError: this.pageListener is null 07:21:38 INFO - TEST-INFO | 9860: exit 0 07:21:38 INFO - Browser initialized. 07:21:38 INFO - Running cycle 1/1 for dromaeo_css test... 07:21:38 INFO - TEST-INFO | started process 9953 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpx4NHAs/profile -tp file:/builds/slave/test-pgo/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 07:21:50 INFO - PROCESS | 9953 | RSS: Main: 153735168 07:21:50 INFO - PROCESS | 9953 | 07:22:41 INFO - PROCESS | 9953 | 1458224561922 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] 07:24:48 INFO - PROCESS | 9953 | Cycle 1(1): loaded http://localhost:43716/tests/dromaeo/cssquery-dojo.html (next: http://localhost:43716/tests/dromaeo/cssquery-ext.html) 07:24:49 INFO - PROCESS | 9953 | RSS: Main: 259817472 07:24:49 INFO - PROCESS | 9953 | 07:27:51 INFO - PROCESS | 9953 | Cycle 1(1): loaded http://localhost:43716/tests/dromaeo/cssquery-ext.html (next: http://localhost:43716/tests/dromaeo/cssquery-jquery.html) 07:27:52 INFO - PROCESS | 9953 | RSS: Main: 237121536 07:27:52 INFO - PROCESS | 9953 | 07:30:53 INFO - PROCESS | 9953 | Cycle 1(1): loaded http://localhost:43716/tests/dromaeo/cssquery-jquery.html (next: http://localhost:43716/tests/dromaeo/cssquery-mootools.html) 07:30:54 INFO - PROCESS | 9953 | RSS: Main: 244080640 07:30:54 INFO - PROCESS | 9953 | 07:33:56 INFO - PROCESS | 9953 | Cycle 1(1): loaded http://localhost:43716/tests/dromaeo/cssquery-mootools.html (next: http://localhost:43716/tests/dromaeo/cssquery-prototype.html) 07:33:56 INFO - PROCESS | 9953 | RSS: Main: 221880320 07:33:56 INFO - PROCESS | 9953 | 07:36:59 INFO - PROCESS | 9953 | Cycle 1(1): loaded http://localhost:43716/tests/dromaeo/cssquery-prototype.html (next: http://localhost:43716/tests/dromaeo/cssquery-yui.html) 07:37:00 INFO - PROCESS | 9953 | RSS: Main: 220680192 07:37:00 INFO - PROCESS | 9953 | 07:40:02 INFO - PROCESS | 9953 | Cycle 1(1): loaded http://localhost:43716/tests/dromaeo/cssquery-yui.html (next: http://localhost:43716/tests/dromaeo/cssquery-dojo.html) 07:40:02 INFO - PROCESS | 9953 | RSS: Main: 265654272 07:40:02 INFO - PROCESS | 9953 | 07:40:02 INFO - PROCESS | 9953 | __start_tp_report 07:40:02 INFO - PROCESS | 9953 | _x_x_mozilla_page_load 07:40:02 INFO - PROCESS | 9953 | _x_x_mozilla_page_load_details 07:40:02 INFO - PROCESS | 9953 | |i|pagename|runs| 07:40:02 INFO - PROCESS | 9953 | |0;dojo.html;3057.847107644618;3069.6009518762557;3107.5804766356537;3112.517559778235;3146.9929622520795;5209.166533354664;5259.211118332252;5259.289995850559;5266.157414813631;5288.524032837044;5300.469953004697;5364.409914909357;5371.623986320959;5374.6506477078965;5391.514763671269;4744.098621261966;4745.430548334205;4789.473157952622;4866.099771542258;4892.730899800509;4695.8356457524;4825.2279635258365;4841.709497430148;4892.412910450751;4899.6325275604295;4792.472827988919;4811.374521312242;4824.276358546211;4870.439899411577;4880.487548807378;4688.718676879398;4705.717656940595;4708.693934894221;4708.905821883577;4738.95261047392;4662.8368007119925;4690.906181876378;4697.459792123916;4722.645801564862;4749.905001899977;5216.087184742692;5219.138842091051;5227.45111763267;5238.895222095575;5239.869003274911;5636.464535869086;5658.0381335173115;5662.66024038559;5667.433256674341;5672.574556908207;5604.8318550443555;5700.857478563069;5702.6293290935955;5706.029974904276;5767.106098554731;5346.198070289449;5352.892942141136;5358;5365.7585408656705;5374.865628359284;5822.272215973004;5838.854028649318;5844;5845.824625261249;5847.649141051465;5370;5541.750621222055;5591.52472039873;5591.916121258185;5649.717514124277;5589.413111623302;5611.859703507445;5615.0454422748235;5618.606697531133;5622.91565626516;5534.252875861787;5543.168524721244;5546.944530554723;5549.944500555023;5587.664740115606;5485.890282194334;5570.164475328652;5616.045272303718;5622.8313150605545;5648.096304591246;4323.113761678848;4342.630876375543;4343.2182207203;4346;4383.627391671744;3758.1356288053903;3857.3442514772555;3878.340682083996;3931.5282166139673;3950.2692001979726;5316.202569614588;5331.680099194061;5343.572514198855;5373.892522149535;5387.191921211771;5650.434956504317;5680.77276908919;5683.5737319700365;5684.8294551163535;5684.9431505684415;5189.6886186828915;5362.570994320445;5367.605367605402;5379.865503362369;5411.729413529308;4883.8290659826735;4904.43598986114;4904.901901962012;4918.262260660929;4950.579200767903;5856.355800861902;5870.677112758839;5879.52963762898;5882.882342353129;5885.234919460443;5565.471280228372;5657.8019769307875;5683.9715801420725;5713.857153571111;5783.3638299787835;5923.644581325134;5934.762609495572;5939.3466718661775;5939.910901336397;5943;5621.550275977994;5648.435156484319;5648.5481161507805;5648.604597678123;5652.660840349592;5535.446455354432;5690.260266165372;5712.11462223356;5713.114467257582;5784.045632470596;5571.721413929206;5582.720863956867;5586.804461843816;5588.888222235451;5595.692236927008;5514.95215908976;5538.16927460868;5561.888762224814;5564.554835613222;5565.805196818092;5355.812546560852;5475.863103422446;5509.972450137724;5511.283533140827;5557.888842223052;5535.308086489189;5537.889242215214;5557.499825015768;5562.972185139049;5568.359638641608;5285.894282114413;5443.673379597237;5453.727313634223;5458.2904222450825;5518.724063796713 07:40:02 INFO - PROCESS | 9953 | |1;ext.html;532.989340213196;559.4405594405594;570.8943845388601;585.0463744097123;600.768704048941;29543.26141846452;38851.41722874156;39555.2088958221;39610.80194599023;39691.20617587647;40672.59327406725;41340.379894301535;41361.17277654445;41377.37933930993;41447.171056578925;7451.776446706607;8929.330300227493;9165.450072995609;9169.174774270314;10133.746656333613;10208.958208358357;10450.947745261263;10457.84313235302;10458.633947811828;10463.215258855578;10115;10129.088382045615;10224.795504089914;10230.386176829414;10230.641927532537;10379.117774989098;10512;10512.78974420511;10519.211059170517;10520.158387329071;10236.43699596522;10735.141188704885;10736.355818650905;10745.892541074645;10747.19396045292;41340.793296033626;41934.370984435256;41938;41970.37044444336;41981.37027944583;3478.773879697837;3495.4582039783872;3687.0413692439893;3804.904877378088;3812.1803812180515;28261.15216543507;29499.70500294991;31169.84415077933;31222.582395968584;31677.36645267105;4300.65594752419;4311.8706438806885;4343.153085148398;4395.670324725626;4397.142557201347;330511;330721;331373;331558.9999999976;332549;45688.543114569096;62881.37118628847;63403;63412.68293658502;63547;45348;45439.54560454419;45502.77248613802;45705.771471142434;45855;14430.278486075655;15386.384544618313;15675.686486270211;15676.451324203597;15684.058956462648;11793.52825886955;11921.225120367322;11964;11967.940160299317;11976.940115299367;14840.480583179537;14883.330250138553;14896.478623248135;14956.925215373854;14967.476138335323;5957.6127551709;6048.968313740352;6118.938810611926;6132.264128304632;6154.692265386713;904.8778414914034;973.3721749471551;995.5271246158162;1000.8798944126606;1005.2962925951863;31889.840550797562;31944.520832187536;32002.519962200586;32141.67858321387;32650.34699306048;1131.8811524789778;1139.6979800352913;1151.7638884028754;1183.650823007215;1202.3988005997;16303.266353014144;16458.588535286715;16533;16579.419720309972;16703.582410439838;387776;392165;392705;393003;393046;55387.29208017283;56835;56837.715811420676;56902.43097569054;56925;1253.291890082119;1324.3378310844578;1415.8408427148681;1420.843707192208;1429.8856091512655;28066.158015259574;28966.855165724035;30848.537271941386;31023.224419388793;31711.52432713465;45883;46233.537664624266;46265.53734462612;46365.84085397892;46402.071958559965;247975;247984;248153;249267;249838;29754.851225743732;34616.48075278822;34651.30697386088;34957;35134.82432587821;39922.201555969295;40108.59891401049;40667.7966610165;40972;41403.378949315185;37758.483033932134;38103;38344.23311533698;38605.613943860204;38693.22613547657;37193.81403092967;37775.62224377831;37844.432333514465;38140;38324.041898952746;39174.90032934718;39823.402648960866;40032.799836001795;40343.79828100958;40361.59638403579;33077.00768976934;34155;34535.30929381348;34863;34966.47550286799;23948.640770388807;24500.142495012587;24541;28526.313685515113;31229.375412492078 07:40:02 INFO - PROCESS | 9953 | |2;jquery.html;360.12848905648326;360.7474767662636;364.9781013139211;365.78235949609973;372.4190263189423;17229.396971105998;17390;18485.53786155347;18509.074546272685;18514.166862491187;17364.56588585286;17622.64754704905;17788.46634600964;17802.19890104945;17805.73291400627;5361.571074314055;5616;5621.662700237999;5624.718764061801;5625.54995600351;4046.534648515414;4179.017930786263;4183.226103170908;5460.808871689492;5667.829965101033;5772.278465191851;5797.1594118852745;5806.303243610751;5837.357890632027;5842.737076831553;5600.719964001804;5774.249347584808;5898.115282707607;5920.407959204088;5945.554083443759;3641.508396366483;5085.516875896784;5195.870103247411;5227.2159176123505;5257.553107985826;21242.575148496944;21329.466763331042;21564.245251416283;21624.135034598596;21804;2539.5682733935278;2617;2706.188143556925;3042.6196725409322;3128.3743251349592;13481.258530780804;13498.527551535748;13539;13654.590362289147;14358.641033974234;1990.2735501541977;1995.4213278149318;2004.3285499357733;2023.7267968824167;2038.2458490358515;67649.32350676479;69298.3070169302;69364.30635693629;69533.65233173802;70769.29230707628;10666.466676666136;10727.678169654922;10763.408012559385;10860.728481788019;11087.279326843729;13788.103773254707;14002;14026.509072182425;14046.438142474391;14049.086809357359;8373.995120585569;8581.78545536354;8619.22426981562;8685.174908383693;8747.300215982707;8653.6538538459;8674.522901240367;8691.217790398894;8821.867671984925;8846.955765221133;6457.128287681103;6585.374389432996;6603.471722262208;6606.504512161511;6621.304762999912;1684.8062472815784;1763.867709921761;1830.6979348407363;1858.5353661584604;1863.9627207455776;1056.8358197150696;1066.386827574148;1073.5491093740648;1118.8489553910117;1204.313541281461;17763.822361776216;18144.025680774957;18396.724049139273;18808.871467711982;18888.622227555374;924.3390975452584;979.8481235408523;1041.9895801042044;1066.7279843639978;1135.6593022093339;10357.791029297308;10582.735431614117;10640.840387394195;10652.254342195973;10791.190660700478;434317;436509;436660;459602;516785;78851.60574197093;82225;82864;83910;84548;1107.5182295701557;1114.7547539541288;1116.9776604467866;1122.6688127002553;1124.6232512108536;16368;16462.917685411496;16496.42262520806;16555.50333489997;16589.751153732945;34143.4878476828;35115.29769404547;35650.28699426049;36475.45286820753;36721.26557468889;51812.48187518077;52910.20634690406;53009;53038.73480632572;53798.462015379344;7645.6559454823555;7922.841543168989;8019.198080192167;8190.385721071063;8265.669373225244;9128.589213485277;9607.807843842944;11983.520659173535;12647.177933434665;13018.218906865619;11307.151963602599;11491.770164596828;11500.827487587525;11513.712157196138;11640.592579259684;10945.507452164513;11126.60193596706;11202.383868886964;11586.188966772244;11747;11171.832422513831;11632.53469861196;11645.941770291432;11816.645500634995;12020.218685785396;8057.919420805717;8169.305609023299;8193.754187374388;8333.583320833814;8455.239028487465;9919.851202231828;11157;11278.605248816251;11315.547378104784;11461.140414468782 07:40:02 INFO - PROCESS | 9953 | |3;mootools.html;1237.870023647517;1304.1653341861208;1312.8752768487002;1328.5018118205674;1806.1691621853938;7842.529448233103;8045.316148127409;8086;8093.716719914804;8103.10865804761;7953.403494737903;8103.39224558159;8107.91892081079;8113.391495637821;8119.228673276044;2002.899855007251;2039.6736522156457;2306.4695120122383;2341.356127065054;2364.7871691547757;2367.9644805327935;2378.702662167229;2379.7144342678903;2385.3321070100315;2385.940351491209;2279.7720227977234;2281.7604151564096;2334.48641298914;2336.5210131922913;2337.976620233793;2276.5902137615303;2291.175176936302;2301.102569997702;2351.811855051592;2355.9057637694473;2293.5183611441616;2302.458922153293;2320.5706944215203;2328.8136949044206;2346.741858395575;8162.347012239006;8214.1375155609;8230.176982301782;8240;8242;4912.508749125094;5047.747612619354;5047.7476126193915;5049.520295571915;5049.545540901337;3363.7477189210663;3431.159365955357;3486.9302613947834;3505.1762835733584;3510.5436293281964;1171.133361312631;1171.8535183102113;1182.1665725663386;1196.342011893455;1221.2611370121037;11276.041536469327;11291.153163512769;11292.096632269398;11308.604198853083;11325.660230193107;4442.511323754385;4517.728936263835;4554.0891821635805;4586.312053192048;4611.654125940568;9582.089701478348;9593.28050396223;9597.040295970348;9601.567929443192;9618.470984095802;5039.672421292605;5062.772175252123;5067.366579177603;5080.339555857715;5080.441151473335;4102.3026085564925;4576.542345765397;4660.766961651904;4694.413198350207;4704.741239231875;3883.902902427462;3939.468171796828;3971.8808435746973;3998.660113890294;4006.677796327205;1237.900967922564;1239.8078297863665;1247.9625611231677;1250.0499620288465;1253.7805883970268;1265.0638527489775;1296.7212049409234;1321.9735605288033;1388.5556621881103;1410.2314238739912;7731.226877312336;7744.186860379579;7799.727009554638;7867.567283799332;7869;484.5275856040332;491.7172625740214;491.9508049195052;492.202631736589;493.043495618499;5746.396628354046;5754.510866576388;5756.481916627524;5780.855478612984;5791.218185544897;9517.381370210915;10126.848097278547;10158.847617285746;10260.281780275309;10292.639757608447;9985.650502232387;10002.099811017044;10102.747431314128;10127.696169114792;10133.442660653587;7604.771856844303;7808.258215469521;7828.2954534092205;7901.933239012775;7940.523568585903;7480.401567874448;7480.850382992418;7495.17553069151;7503.13713922884;7511.06111736033;8811.867821982547;8892.110788921056;9011.864822027545;9170.266378689555;9195.862062069207;9152.63389464414;9208.539573021188;9255.86116208244;9371;9416.858747118935;6378.45783108441;6973.755918542826;7178.318059784312;7311.488195826454;7382.335589796944;7877.921220787719;7893.605319733875;7896.84206315859;7919.643616037177;7928.960355198187;7044.401225895651;7162.89255661176;7193.676284567312;7269.636518174176;7285.125784905846;6857.931420685929;6945.409640180641;7036.050133231948;7129.500934934505;7131.072960515307;7200.135983681992;7505.774826755206;7506.211847755907;7511.624418779148;7515.13575938774;6956.582605043714;6972.477064220305;6984.895226571504;7003.29967003316;7013.333733295329;6765.9661701691175;6882.174139103339;7091.9290807091265;7103.538270012433;7105.3960413363375 07:40:02 INFO - PROCESS | 9953 | |4;prototype.html;344.06586118687756;344.5314372453463;345.9117924929143;349.4310545650032;352.26728404917776;5969.044952807551;5977.193078934342;5989.5807293489415;5991.400859914006;6001.309849367313;5890.764369425228;5953.88092238155;6001.639901605907;6004.849878753033;6009.519238460924;4348.239058164824;4488.955110448903;4568.862934111982;4583.289590113538;4588.885277868063;4576;4602.217623004098;4605.30920361945;4626.537346265363;4631.073785242948;4573.245414506602;4581.977090114561;4583.724976501404;4586.7477288749105;4601.861944141681;4315.482142142947;4428.557144285562;4537.727736335797;4555.977220113911;4556.863294101182;3956.5054368203973;3958.9010274743073;3962.7622342659242;3966.107625784204;3967.226390853785;5809.767609295665;5813;5813.418658134153;5816.360200377955;5820;5278.81524146653;5282.4189339173045;5283.260343551906;5283.947160528384;5289.20661900718;6288.717007734663;6303.149074874925;6304.87390252197;6305.968470157666;6310.7791227306825;4312.180685669713;4382.167388196264;4407.625351845097;4409.09613529229;4414.514403415654;6569.310222426672;6584.209894812653;6585.5719378240265;6610.966945165292;6611.86776264472;4470.128324976663;4511.1654343946475;4512.368268442421;4512.796924138422;4517.322401639714;4564.383808185852;4566.223741963874;4566.223741963874;4575.062112266977;4584.426946631671;5265.52610265078;5268.183431568036;5273.1035723927025;5280.339957505312;5284.603654725911;6200.3799620037635;6348.809535713936;6358.078078678565;6362.936370636235;6369.267534233622;1589.5390336802197;1599.4561848971405;1611.7421212605927;1612.5001249612424;1616.5554472519916;1021.300409219672;1070.9732256693644;1084.7993121272432;1086.6577028236081;1111.2998810749177;5977.581569290195;6032.095185722177;6035.6076855004285;6045.909311360333;6046.3349031606485;6404.775832845921;6439.839004024937;6478.34802125455;6489.805305840738;6504.447121994684;6081.604695694766;6087.512998960073;6094.695265236809;6103.023516237381;6103.511719062464;3472.3749725049734;3511.1924257420937;3513.0514761014383;3513.0865974846215;3513.4905438711244;6541.869162616721;6713.899291510631;6725.932740672629;6728.058071869942;6732.427743641845;6631.469482441393;6639.203295604559;6639.86720265592;6642.501812364092;6646.634435106115;6692.665366731741;6738.764143255061;6776.72893084281;6786.117804685458;6788.422984046411;6454.67726613658;6473.255575608677;6480.708368123352;6487.124238227968;6494.545381823227;6305.274893387319;6394.104825324552;6401.743930242738;6631.767888123893;6635.0710900473005;6780.660966951534;6860.0738900247825;6871.381575658214;6871.553349032297;6871.690773915086;4491.505934347285;4534.977325113353;4536.637069034403;4536.8638940831825;4540.704854184468;6610.4050635443045;6613.66931653425;6615.768448104293;6619.106420633153;6623.701933412912;6304.621722696653;6406.839829004312;6426.036094585849;6431.678416079271;6437.098806167047;6355.269144048309;6390.648514331757;6393.232812062396;6396.48828093742;6396.6481843497195;6282.2147231596055;6282.811515654537;6284.968575157095;6287.402696743802;6298.0552917062805;6402.9679851602305;6404.839879003062;6406.103145559532;6407.359264073555;6408.93591064102;5991.490723288395;6090.725917333642;6165.660888651168;6272.372762723691;6280.277768056732 07:40:02 INFO - PROCESS | 9953 | |5;yui.html;756.8524137793125;762.5539059650105;772.6291380137537;834.6786487202427;862.4997501449158;14050.227237501933;14139.434422623082;14251.50119745809;14293.999999999987;14317.140971541701;12092.818607720892;13543.796843047363;13624.250666213355;13636.38636261368;13673.24797136157;821.1131977464339;832.5129799067553;834.3325339728193;839.9580020998956;841.6212704283066;832.1470492744954;839.1734141870253;839.3159574946429;840.7771940435789;846.8772028055928;866.384866744612;868.7480630617114;870.2081106193365;871.9520426376547;873.4409977614332;863.1541089732035;868.7784614923186;869.7303835810919;869.9956500217459;870.3646338173106;625.327772644409;626.4768917953514;627.7300760672908;629.408356145222;631.8894193516162;12829.23024618526;12841.165324253894;12963.092583519157;12995.155314904501;13014.934925325313;11940.70148246292;12020.63938081859;12027.57903473383;12141.635750927398;12311.138220324581;10132.848007279898;10409.9479502602;10410.79178416435;10540.736481587945;10601.628942986958;3671.375866102769;3729.272791805599;3739.738218324718;3789.412641040643;3813.2182902505197;43125.56874431247;43953.12093758139;49048;50249.24626130648;50278.7486062571;9858.901410985942;9934.453605051647;9966.152877005536;10122.240831937634;10286.919873413333;18575.349862754738;18712.157952892154;18731.719024214646;18768.53078673044;19034.714479282822;7973.162817904153;8203.097659257477;8261.38039647029;8617.181367770052;8746.825063498822;4718.127146477913;4812.687175333592;4820.132376172252;4872.975635121802;4974.925376119361;3141.9842900785807;3154.41643295991;3170.3342298117655;3181.761367897417;3190.9042728718177;605.6003037994902;611.4450219753588;613.8710870717199;616.2604874150948;631.26457676806;728.2098922668857;730.3682314797662;732.3372348025046;736.694271877165;740.8481261341412;9384.483853387992;9664.226861851035;9824.803503929881;9913.157381622499;9990.100890919852;579.2990481517411;615.8460384903774;690.068407649679;691.8443350246155;703.6657587645827;4343.717658352197;4477.171723231213;4482.28283474649;4575.359449677047;4615.399998000238;60998;61007;61173;61777;61815.381846180964;50698.49301507012;50725.23912141321;51674.48325516697;51836;52062.73968630133;49733.75133124311;49971;50539.747301264;50835.49164508308;51915.48084519182;9899.802003960025;9949.303548751517;9959;10106.898931010595;10120.493975301353;36832.26335473222;37566;38640.42039369355;39363.80318098391;39609.603903961746;45649.31526027179;46861.76569117133;50527.24209136792;50690;50990.74504627453;12015.219010764273;12019.4591243396;12043.638690839289;12102.2540186186;12325.220093216007;13394.93302533481;13565.660858478617;13674.384652690454;13694.863051369757;14261.572152835432;11321;11479.139064570358;11593.536258549564;11962.282263064244;12341.13612047184;10809.35143891369;11227.684321068651;11393.658190254306;11854.466549005143;11901.523939042341;10874.67375978722;10945.343279403261;11016;11265.943670281596;11295.604653837076;9723.270754693567;9828.754281143028;9929.602815887283;9939.353941993748;9984.700458986243;9883.802323953625;10158.492075396349;10169.491525423848;10170.847437288594;10212.489375531342 07:40:02 INFO - PROCESS | 9953 | __end_tp_report 07:40:02 INFO - PROCESS | 9953 | __start_cc_report 07:40:02 INFO - PROCESS | 9953 | _x_x_mozilla_cycle_collect,777 07:40:02 INFO - PROCESS | 9953 | __end_cc_report 07:40:02 INFO - PROCESS | 9953 | __startTimestamp1458225602537__endTimestamp 07:40:02 INFO - PROCESS | 9953 | 07:40:02 INFO - PROCESS | 9953 | ------- Summary: start ------- 07:40:02 INFO - PROCESS | 9953 | Number of tests: 6 07:40:02 INFO - PROCESS | 9953 | 07:40:02 INFO - PROCESS | 9953 | [#0] dojo.html Cycles:165 Average:5261.17 Median:5485.89 stddev:599.26 (10.9%) stddev-sans-first:575.63 07:40:02 INFO - PROCESS | 9953 | Values: 3057.8 3069.6 3107.6 3112.5 3147.0 5209.2 5259.2 5259.3 5266.2 5288.5 5300.5 5364.4 5371.6 5374.7 5391.5 4744.1 4745.4 4789.5 4866.1 4892.7 4695.8 4825.2 4841.7 4892.4 4899.6 4792.5 4811.4 4824.3 4870.4 4880.5 4688.7 4705.7 4708.7 4708.9 4739.0 4662.8 4690.9 4697.5 4722.6 4749.9 5216.1 5219.1 5227.5 5238.9 5239.9 5636.5 5658.0 5662.7 5667.4 5672.6 5604.8 5700.9 5702.6 5706.0 5767.1 5346.2 5352.9 5358.0 5365.8 5374.9 5822.3 5838.9 5844.0 5845.8 5847.6 5370.0 5541.8 5591.5 5591.9 5649.7 5589.4 5611.9 5615.0 5618.6 5622.9 5534.3 5543.2 5546.9 5549.9 5587.7 5485.9 5570.2 5616.0 5622.8 5648.1 4323.1 4342.6 4343.2 4346.0 4383.6 3758.1 3857.3 3878.3 3931.5 3950.3 5316.2 5331.7 5343.6 5373.9 5387.2 5650.4 5680.8 5683.6 5684.8 5684.9 5189.7 5362.6 5367.6 5379.9 5411.7 4883.8 4904.4 4904.9 4918.3 4950.6 5856.4 5870.7 5879.5 5882.9 5885.2 5565.5 5657.8 5684.0 5713.9 5783.4 5923.6 5934.8 5939.3 5939.9 5943.0 5621.6 5648.4 5648.5 5648.6 5652.7 5535.4 5690.3 5712.1 5713.1 5784.0 5571.7 5582.7 5586.8 5588.9 5595.7 5515.0 5538.2 5561.9 5564.6 5565.8 5355.8 5475.9 5510.0 5511.3 5557.9 5535.3 5537.9 5557.5 5563.0 5568.4 5285.9 5443.7 5453.7 5458.3 5518.7 07:40:02 INFO - PROCESS | 9953 | 07:40:02 INFO - PROCESS | 9953 | [#1] ext.html Cycles:180 Average:49222.62 Median:19170.89 stddev:86404.97 (450.7%) stddev-sans-first:86570.02 07:40:02 INFO - PROCESS | 9953 | Values: 533.0 559.4 570.9 585.0 600.8 29543.3 38851.4 39555.2 39610.8 39691.2 40672.6 41340.4 41361.2 41377.4 41447.2 7451.8 8929.3 9165.5 9169.2 10133.7 10209.0 10450.9 10457.8 10458.6 10463.2 10115.0 10129.1 10224.8 10230.4 10230.6 10379.1 10512.0 10512.8 10519.2 10520.2 10236.4 10735.1 10736.4 10745.9 10747.2 41340.8 41934.4 41938.0 41970.4 41981.4 3478.8 3495.5 3687.0 3804.9 3812.2 28261.2 29499.7 31169.8 31222.6 31677.4 4300.7 4311.9 4343.2 4395.7 4397.1 330511.0 330721.0 331373.0 331559.0 332549.0 45688.5 62881.4 63403.0 63412.7 63547.0 45348.0 45439.5 45502.8 45705.8 45855.0 14430.3 15386.4 15675.7 15676.5 15684.1 11793.5 11921.2 11964.0 11967.9 11976.9 14840.5 14883.3 14896.5 14956.9 14967.5 5957.6 6049.0 6118.9 6132.3 6154.7 904.9 973.4 995.5 1000.9 1005.3 31889.8 31944.5 32002.5 32141.7 32650.3 1131.9 1139.7 1151.8 1183.7 1202.4 16303.3 16458.6 16533.0 16579.4 16703.6 387776.0 392165.0 392705.0 393003.0 393046.0 55387.3 56835.0 56837.7 56902.4 56925.0 1253.3 1324.3 1415.8 1420.8 1429.9 28066.2 28966.9 30848.5 31023.2 31711.5 45883.0 46233.5 46265.5 46365.8 46402.1 247975.0 247984.0 248153.0 249267.0 249838.0 29754.9 34616.5 34651.3 34957.0 35134.8 39922.2 40108.6 40667.8 40972.0 41403.4 37758.5 38103.0 38344.2 38605.6 38693.2 37193.8 37775.6 37844.4 38140.0 38324.0 39174.9 39823.4 40032.8 40343.8 40361.6 33077.0 34155.0 34535.3 34863.0 34966.5 23948.6 24500.1 24541.0 28526.3 31229.4 07:40:02 INFO - PROCESS | 9953 | 07:40:02 INFO - PROCESS | 9953 | [#2] jquery.html Cycles:180 Average:27008.51 Median:2578.28 stddev:75211.90 (2917.1%) stddev-sans-first:75396.27 07:40:02 INFO - PROCESS | 9953 | Values: 360.1 360.7 365.0 365.8 372.4 17229.4 17390.0 18485.5 18509.1 18514.2 17364.6 17622.6 17788.5 17802.2 17805.7 5361.6 5616.0 5621.7 5624.7 5625.5 4046.5 4179.0 4183.2 5460.8 5667.8 5772.3 5797.2 5806.3 5837.4 5842.7 5600.7 5774.2 5898.1 5920.4 5945.6 3641.5 5085.5 5195.9 5227.2 5257.6 21242.6 21329.5 21564.2 21624.1 21804.0 2539.6 2617.0 2706.2 3042.6 3128.4 13481.3 13498.5 13539.0 13654.6 14358.6 1990.3 1995.4 2004.3 2023.7 2038.2 67649.3 69298.3 69364.3 69533.7 70769.3 10666.5 10727.7 10763.4 10860.7 11087.3 13788.1 14002.0 14026.5 14046.4 14049.1 8374.0 8581.8 8619.2 8685.2 8747.3 8653.7 8674.5 8691.2 8821.9 8847.0 6457.1 6585.4 6603.5 6606.5 6621.3 1684.8 1763.9 1830.7 1858.5 1864.0 1056.8 1066.4 1073.5 1118.8 1204.3 17763.8 18144.0 18396.7 18808.9 18888.6 924.3 979.8 1042.0 1066.7 1135.7 10357.8 10582.7 10640.8 10652.3 10791.2 434317.0 436509.0 436660.0 459602.0 516785.0 78851.6 82225.0 82864.0 83910.0 84548.0 1107.5 1114.8 1117.0 1122.7 1124.6 16368.0 16462.9 16496.4 16555.5 16589.8 34143.5 35115.3 35650.3 36475.5 36721.3 51812.5 52910.2 53009.0 53038.7 53798.5 7645.7 7922.8 8019.2 8190.4 8265.7 9128.6 9607.8 11983.5 12647.2 13018.2 11307.2 11491.8 11500.8 11513.7 11640.6 10945.5 11126.6 11202.4 11586.2 11747.0 11171.8 11632.5 11645.9 11816.6 12020.2 8057.9 8169.3 8193.8 8333.6 8455.2 9919.9 11157.0 11278.6 11315.5 11461.1 07:40:02 INFO - PROCESS | 9953 | 07:40:02 INFO - PROCESS | 9953 | [#3] mootools.html Cycles:180 Average:5747.92 Median:5073.85 stddev:3033.99 (59.8%) stddev-sans-first:3023.56 07:40:02 INFO - PROCESS | 9953 | Values: 1237.9 1304.2 1312.9 1328.5 1806.2 7842.5 8045.3 8086.0 8093.7 8103.1 7953.4 8103.4 8107.9 8113.4 8119.2 2002.9 2039.7 2306.5 2341.4 2364.8 2368.0 2378.7 2379.7 2385.3 2385.9 2279.8 2281.8 2334.5 2336.5 2338.0 2276.6 2291.2 2301.1 2351.8 2355.9 2293.5 2302.5 2320.6 2328.8 2346.7 8162.3 8214.1 8230.2 8240.0 8242.0 4912.5 5047.7 5047.7 5049.5 5049.5 3363.7 3431.2 3486.9 3505.2 3510.5 1171.1 1171.9 1182.2 1196.3 1221.3 11276.0 11291.2 11292.1 11308.6 11325.7 4442.5 4517.7 4554.1 4586.3 4611.7 9582.1 9593.3 9597.0 9601.6 9618.5 5039.7 5062.8 5067.4 5080.3 5080.4 4102.3 4576.5 4660.8 4694.4 4704.7 3883.9 3939.5 3971.9 3998.7 4006.7 1237.9 1239.8 1248.0 1250.0 1253.8 1265.1 1296.7 1322.0 1388.6 1410.2 7731.2 7744.2 7799.7 7867.6 7869.0 484.5 491.7 492.0 492.2 493.0 5746.4 5754.5 5756.5 5780.9 5791.2 9517.4 10126.8 10158.8 10260.3 10292.6 9985.7 10002.1 10102.7 10127.7 10133.4 7604.8 7808.3 7828.3 7901.9 7940.5 7480.4 7480.9 7495.2 7503.1 7511.1 8811.9 8892.1 9011.9 9170.3 9195.9 9152.6 9208.5 9255.9 9371.0 9416.9 6378.5 6973.8 7178.3 7311.5 7382.3 7877.9 7893.6 7896.8 7919.6 7929.0 7044.4 7162.9 7193.7 7269.6 7285.1 6857.9 6945.4 7036.1 7129.5 7131.1 7200.1 7505.8 7506.2 7511.6 7515.1 6956.6 6972.5 6984.9 7003.3 7013.3 6766.0 6882.2 7091.9 7103.5 7105.4 07:40:02 INFO - PROCESS | 9953 | 07:40:02 INFO - PROCESS | 9953 | [#4] prototype.html Cycles:180 Average:5304.34 Median:6007.18 stddev:1598.68 (26.6%) stddev-sans-first:1559.21 07:40:02 INFO - PROCESS | 9953 | Values: 344.1 344.5 345.9 349.4 352.3 5969.0 5977.2 5989.6 5991.4 6001.3 5890.8 5953.9 6001.6 6004.8 6009.5 4348.2 4489.0 4568.9 4583.3 4588.9 4576.0 4602.2 4605.3 4626.5 4631.1 4573.2 4582.0 4583.7 4586.7 4601.9 4315.5 4428.6 4537.7 4556.0 4556.9 3956.5 3958.9 3962.8 3966.1 3967.2 5809.8 5813.0 5813.4 5816.4 5820.0 5278.8 5282.4 5283.3 5283.9 5289.2 6288.7 6303.1 6304.9 6306.0 6310.8 4312.2 4382.2 4407.6 4409.1 4414.5 6569.3 6584.2 6585.6 6611.0 6611.9 4470.1 4511.2 4512.4 4512.8 4517.3 4564.4 4566.2 4566.2 4575.1 4584.4 5265.5 5268.2 5273.1 5280.3 5284.6 6200.4 6348.8 6358.1 6362.9 6369.3 1589.5 1599.5 1611.7 1612.5 1616.6 1021.3 1071.0 1084.8 1086.7 1111.3 5977.6 6032.1 6035.6 6045.9 6046.3 6404.8 6439.8 6478.3 6489.8 6504.4 6081.6 6087.5 6094.7 6103.0 6103.5 3472.4 3511.2 3513.1 3513.1 3513.5 6541.9 6713.9 6725.9 6728.1 6732.4 6631.5 6639.2 6639.9 6642.5 6646.6 6692.7 6738.8 6776.7 6786.1 6788.4 6454.7 6473.3 6480.7 6487.1 6494.5 6305.3 6394.1 6401.7 6631.8 6635.1 6780.7 6860.1 6871.4 6871.6 6871.7 4491.5 4535.0 4536.6 4536.9 4540.7 6610.4 6613.7 6615.8 6619.1 6623.7 6304.6 6406.8 6426.0 6431.7 6437.1 6355.3 6390.6 6393.2 6396.5 6396.6 6282.2 6282.8 6285.0 6287.4 6298.1 6403.0 6404.8 6406.1 6407.4 6408.9 5991.5 6090.7 6165.7 6272.4 6280.3 07:40:02 INFO - PROCESS | 9953 | 07:40:02 INFO - PROCESS | 9953 | [#5] yui.html Cycles:180 Average:14474.61 Median:26960.49 stddev:16772.08 (62.2%) stddev-sans-first:16787.50 07:40:02 INFO - PROCESS | 9953 | Values: 756.9 762.6 772.6 834.7 862.5 14050.2 14139.4 14251.5 14294.0 14317.1 12092.8 13543.8 13624.3 13636.4 13673.2 821.1 832.5 834.3 840.0 841.6 832.1 839.2 839.3 840.8 846.9 866.4 868.7 870.2 872.0 873.4 863.2 868.8 869.7 870.0 870.4 625.3 626.5 627.7 629.4 631.9 12829.2 12841.2 12963.1 12995.2 13014.9 11940.7 12020.6 12027.6 12141.6 12311.1 10132.8 10409.9 10410.8 10540.7 10601.6 3671.4 3729.3 3739.7 3789.4 3813.2 43125.6 43953.1 49048.0 50249.2 50278.7 9858.9 9934.5 9966.2 10122.2 10286.9 18575.3 18712.2 18731.7 18768.5 19034.7 7973.2 8203.1 8261.4 8617.2 8746.8 4718.1 4812.7 4820.1 4873.0 4974.9 3142.0 3154.4 3170.3 3181.8 3190.9 605.6 611.4 613.9 616.3 631.3 728.2 730.4 732.3 736.7 740.8 9384.5 9664.2 9824.8 9913.2 9990.1 579.3 615.8 690.1 691.8 703.7 4343.7 4477.2 4482.3 4575.4 4615.4 60998.0 61007.0 61173.0 61777.0 61815.4 50698.5 50725.2 51674.5 51836.0 52062.7 49733.8 49971.0 50539.7 50835.5 51915.5 9899.8 9949.3 9959.0 10106.9 10120.5 36832.3 37566.0 38640.4 39363.8 39609.6 45649.3 46861.8 50527.2 50690.0 50990.7 12015.2 12019.5 12043.6 12102.3 12325.2 13394.9 13565.7 13674.4 13694.9 14261.6 11321.0 11479.1 11593.5 11962.3 12341.1 10809.4 11227.7 11393.7 11854.5 11901.5 10874.7 10945.3 11016.0 11265.9 11295.6 9723.3 9828.8 9929.6 9939.4 9984.7 9883.8 10158.5 10169.5 10170.8 10212.5 07:40:02 INFO - PROCESS | 9953 | -------- Summary: end -------- 07:40:02 INFO - PROCESS | 9953 | 07:40:03 INFO - TEST-INFO | 9953: exit 0 07:40:03 INFO - TEST-OK | dromaeo_css | took 1110528ms 07:40:03 INFO - TEST-START | kraken 07:40:03 INFO - operating with platform_type : linux_ 07:40:03 INFO - Initialising browser for kraken test... 07:40:03 INFO - TEST-INFO | started process 10144 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmprmX7Bl/profile http://localhost:43716/getInfo.html) 07:40:07 INFO - PROCESS | 10144 | __metrics Screen width/height:1600/1200 07:40:07 INFO - PROCESS | 10144 | colorDepth:24 07:40:07 INFO - PROCESS | 10144 | Browser inner width/height: 1024/697 07:40:07 INFO - PROCESS | 10144 | __metrics 07:40:08 ERROR - PROCESS | 10144 | JavaScript error: resource://app/modules/AboutNewTab.jsm, line 36: TypeError: this.pageListener is null 07:40:08 INFO - TEST-INFO | 10144: exit 0 07:40:08 INFO - Browser initialized. 07:40:08 INFO - Running cycle 1/1 for kraken test... 07:40:08 INFO - TEST-INFO | started process 10227 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmprmX7Bl/profile -tp file:/builds/slave/test-pgo/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 07:40:20 INFO - PROCESS | 10227 | RSS: Main: 153776128 07:40:20 INFO - PROCESS | 10227 | 07:40:23 INFO - PROCESS | 10227 | Cycle 1(1): loaded http://localhost:43716/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:43716/tests/kraken/driver.html?testName=audio-beat-detection) 07:40:23 INFO - PROCESS | 10227 | RSS: Main: 198090752 07:40:23 INFO - PROCESS | 10227 | 07:40:26 INFO - PROCESS | 10227 | Cycle 1(1): loaded http://localhost:43716/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:43716/tests/kraken/driver.html?testName=audio-dft) 07:40:26 INFO - PROCESS | 10227 | RSS: Main: 185827328 07:40:26 INFO - PROCESS | 10227 | 07:40:29 INFO - PROCESS | 10227 | Cycle 1(1): loaded http://localhost:43716/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:43716/tests/kraken/driver.html?testName=audio-fft) 07:40:30 INFO - PROCESS | 10227 | RSS: Main: 170688512 07:40:30 INFO - PROCESS | 10227 | 07:40:32 INFO - PROCESS | 10227 | Cycle 1(1): loaded http://localhost:43716/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:43716/tests/kraken/driver.html?testName=audio-oscillator) 07:40:32 INFO - PROCESS | 10227 | RSS: Main: 173932544 07:40:32 INFO - PROCESS | 10227 | 07:40:35 INFO - PROCESS | 10227 | Cycle 1(1): loaded http://localhost:43716/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:43716/tests/kraken/driver.html?testName=imaging-gaussian-blur) 07:40:35 INFO - PROCESS | 10227 | RSS: Main: 175370240 07:40:35 INFO - PROCESS | 10227 | 07:40:38 INFO - PROCESS | 10227 | Cycle 1(1): loaded http://localhost:43716/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:43716/tests/kraken/driver.html?testName=imaging-darkroom) 07:40:39 INFO - PROCESS | 10227 | RSS: Main: 176074752 07:40:39 INFO - PROCESS | 10227 | 07:40:42 INFO - PROCESS | 10227 | Cycle 1(1): loaded http://localhost:43716/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:43716/tests/kraken/driver.html?testName=imaging-desaturate) 07:40:43 INFO - PROCESS | 10227 | RSS: Main: 174608384 07:40:43 INFO - PROCESS | 10227 | 07:40:46 INFO - PROCESS | 10227 | Cycle 1(1): loaded http://localhost:43716/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:43716/tests/kraken/driver.html?testName=json-parse-financial) 07:40:46 INFO - PROCESS | 10227 | RSS: Main: 175857664 07:40:46 INFO - PROCESS | 10227 | 07:40:48 INFO - PROCESS | 10227 | Cycle 1(1): loaded http://localhost:43716/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:43716/tests/kraken/driver.html?testName=json-stringify-tinderbox) 07:40:48 INFO - PROCESS | 10227 | RSS: Main: 186753024 07:40:48 INFO - PROCESS | 10227 | 07:40:50 INFO - PROCESS | 10227 | Cycle 1(1): loaded http://localhost:43716/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:43716/tests/kraken/driver.html?testName=stanford-crypto-aes) 07:40:51 INFO - PROCESS | 10227 | RSS: Main: 182759424 07:40:51 INFO - PROCESS | 10227 | 07:40:53 INFO - PROCESS | 10227 | Cycle 1(1): loaded http://localhost:43716/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:43716/tests/kraken/driver.html?testName=stanford-crypto-ccm) 07:40:53 INFO - PROCESS | 10227 | RSS: Main: 194625536 07:40:53 INFO - PROCESS | 10227 | 07:40:56 INFO - PROCESS | 10227 | Cycle 1(1): loaded http://localhost:43716/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:43716/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 07:40:56 INFO - PROCESS | 10227 | RSS: Main: 201764864 07:40:56 INFO - PROCESS | 10227 | 07:40:59 INFO - PROCESS | 10227 | Cycle 1(1): loaded http://localhost:43716/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:43716/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 07:40:59 INFO - PROCESS | 10227 | RSS: Main: 200032256 07:40:59 INFO - PROCESS | 10227 | 07:41:01 INFO - PROCESS | 10227 | Cycle 1(1): loaded http://localhost:43716/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:43716/tests/kraken/driver.html?testName=ai-astar) 07:41:01 INFO - PROCESS | 10227 | RSS: Main: 260513792 07:41:01 INFO - PROCESS | 10227 | 07:41:01 INFO - PROCESS | 10227 | __start_tp_report 07:41:01 INFO - PROCESS | 10227 | _x_x_mozilla_page_load 07:41:01 INFO - PROCESS | 10227 | _x_x_mozilla_page_load_details 07:41:01 INFO - PROCESS | 10227 | |i|pagename|runs| 07:41:01 INFO - PROCESS | 10227 | |0;ai-astar;110;111;107;110;111;112;100;111;110;111 07:41:01 INFO - PROCESS | 10227 | |1;audio-beat-detection;150;122;152;168;129;149;148;129;176;126 07:41:01 INFO - PROCESS | 10227 | |2;audio-dft;161;161;160;158;162;161;161;164;163;161 07:41:01 INFO - PROCESS | 10227 | |3;audio-fft;73;72;98;96;73;71;72;106;94;72 07:41:01 INFO - PROCESS | 10227 | |4;audio-oscillator;92;92;142;92;93;93;141;91;92;132 07:41:01 INFO - PROCESS | 10227 | |5;imaging-gaussian-blur;116;117;117;116;116;117;118;117;117;117 07:41:01 INFO - PROCESS | 10227 | |6;imaging-darkroom;146;145;146;144;146;145;145;145;146;145 07:41:01 INFO - PROCESS | 10227 | |7;imaging-desaturate;95;95;96;95;95;94;95;95;95;95 07:41:01 INFO - PROCESS | 10227 | |8;json-parse-financial;57;55;62;55;59;57;55;65;55;56 07:41:01 INFO - PROCESS | 10227 | |9;json-stringify-tinderbox;59;59;59;58;59;59;63;59;60;60 07:41:01 INFO - PROCESS | 10227 | |10;stanford-crypto-aes;77;78;77;78;77;77;77;78;77;78 07:41:01 INFO - PROCESS | 10227 | |11;stanford-crypto-ccm;109;110;110;109;116;114;109;108;110;107 07:41:01 INFO - PROCESS | 10227 | |12;stanford-crypto-pbkdf2;126;124;147;136;137;125;134;134;135;138 07:41:01 INFO - PROCESS | 10227 | |13;stanford-crypto-sha256-iterative;66;64;63;62;66;65;64;65;63;65 07:41:01 INFO - PROCESS | 10227 | __end_tp_report 07:41:01 INFO - PROCESS | 10227 | __start_cc_report 07:41:01 INFO - PROCESS | 10227 | _x_x_mozilla_cycle_collect,1015 07:41:01 INFO - PROCESS | 10227 | __end_cc_report 07:41:01 INFO - PROCESS | 10227 | __startTimestamp1458225661487__endTimestamp 07:41:01 INFO - PROCESS | 10227 | 07:41:01 INFO - PROCESS | 10227 | ------- Summary: start ------- 07:41:01 INFO - PROCESS | 10227 | Number of tests: 14 07:41:01 INFO - PROCESS | 10227 | 07:41:01 INFO - PROCESS | 10227 | [#0] ai-astar Cycles:10 Average:109.30 Median:111.00 stddev:3.53 (3.2%) stddev-sans-first:3.73 07:41:01 INFO - PROCESS | 10227 | Values: 110.0 111.0 107.0 110.0 111.0 112.0 100.0 111.0 110.0 111.0 07:41:01 INFO - PROCESS | 10227 | 07:41:01 INFO - PROCESS | 10227 | [#1] audio-beat-detection Cycles:10 Average:144.90 Median:149.50 stddev:18.23 (12.2%) stddev-sans-first:19.24 07:41:01 INFO - PROCESS | 10227 | Values: 150.0 122.0 152.0 168.0 129.0 149.0 148.0 129.0 176.0 126.0 07:41:01 INFO - PROCESS | 10227 | 07:41:01 INFO - PROCESS | 10227 | [#2] audio-dft Cycles:10 Average:161.20 Median:161.00 stddev:1.62 (1.0%) stddev-sans-first:1.72 07:41:01 INFO - PROCESS | 10227 | Values: 161.0 161.0 160.0 158.0 162.0 161.0 161.0 164.0 163.0 161.0 07:41:01 INFO - PROCESS | 10227 | 07:41:01 INFO - PROCESS | 10227 | [#3] audio-fft Cycles:10 Average:82.70 Median:73.00 stddev:13.94 (19.1%) stddev-sans-first:14.34 07:41:01 INFO - PROCESS | 10227 | Values: 73.0 72.0 98.0 96.0 73.0 71.0 72.0 106.0 94.0 72.0 07:41:01 INFO - PROCESS | 10227 | 07:41:01 INFO - PROCESS | 10227 | [#4] audio-oscillator Cycles:10 Average:106.00 Median:92.00 stddev:22.47 (24.4%) stddev-sans-first:23.25 07:41:01 INFO - PROCESS | 10227 | Values: 92.0 92.0 142.0 92.0 93.0 93.0 141.0 91.0 92.0 132.0 07:41:01 INFO - PROCESS | 10227 | 07:41:01 INFO - PROCESS | 10227 | [#5] imaging-gaussian-blur Cycles:10 Average:116.80 Median:117.00 stddev:0.63 (0.5%) stddev-sans-first:0.60 07:41:01 INFO - PROCESS | 10227 | Values: 116.0 117.0 117.0 116.0 116.0 117.0 118.0 117.0 117.0 117.0 07:41:01 INFO - PROCESS | 10227 | 07:41:01 INFO - PROCESS | 10227 | [#6] imaging-darkroom Cycles:10 Average:145.30 Median:145.50 stddev:0.67 (0.5%) stddev-sans-first:0.67 07:41:01 INFO - PROCESS | 10227 | Values: 146.0 145.0 146.0 144.0 146.0 145.0 145.0 145.0 146.0 145.0 07:41:01 INFO - PROCESS | 10227 | 07:41:01 INFO - PROCESS | 10227 | [#7] imaging-desaturate Cycles:10 Average:95.00 Median:95.00 stddev:0.47 (0.5%) stddev-sans-first:0.50 07:41:01 INFO - PROCESS | 10227 | Values: 95.0 95.0 96.0 95.0 95.0 94.0 95.0 95.0 95.0 95.0 07:41:01 INFO - PROCESS | 10227 | 07:41:01 INFO - PROCESS | 10227 | [#8] json-parse-financial Cycles:10 Average:57.60 Median:57.00 stddev:3.44 (6.0%) stddev-sans-first:3.64 07:41:01 INFO - PROCESS | 10227 | Values: 57.0 55.0 62.0 55.0 59.0 57.0 55.0 65.0 55.0 56.0 07:41:01 INFO - PROCESS | 10227 | 07:41:01 INFO - PROCESS | 10227 | [#9] json-stringify-tinderbox Cycles:10 Average:59.50 Median:59.00 stddev:1.35 (2.3%) stddev-sans-first:1.42 07:41:01 INFO - PROCESS | 10227 | Values: 59.0 59.0 59.0 58.0 59.0 59.0 63.0 59.0 60.0 60.0 07:41:01 INFO - PROCESS | 10227 | 07:41:01 INFO - PROCESS | 10227 | [#10] stanford-crypto-aes Cycles:10 Average:77.40 Median:77.50 stddev:0.52 (0.7%) stddev-sans-first:0.53 07:41:01 INFO - PROCESS | 10227 | Values: 77.0 78.0 77.0 78.0 77.0 77.0 77.0 78.0 77.0 78.0 07:41:01 INFO - PROCESS | 10227 | 07:41:01 INFO - PROCESS | 10227 | [#11] stanford-crypto-ccm Cycles:10 Average:110.20 Median:110.00 stddev:2.74 (2.5%) stddev-sans-first:2.87 07:41:01 INFO - PROCESS | 10227 | Values: 109.0 110.0 110.0 109.0 116.0 114.0 109.0 108.0 110.0 107.0 07:41:01 INFO - PROCESS | 10227 | 07:41:01 INFO - PROCESS | 10227 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:133.60 Median:135.50 stddev:7.01 (5.2%) stddev-sans-first:6.88 07:41:01 INFO - PROCESS | 10227 | Values: 126.0 124.0 147.0 136.0 137.0 125.0 134.0 134.0 135.0 138.0 07:41:01 INFO - PROCESS | 10227 | 07:41:01 INFO - PROCESS | 10227 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:64.30 Median:65.00 stddev:1.34 (2.1%) stddev-sans-first:1.27 07:41:01 INFO - PROCESS | 10227 | Values: 66.0 64.0 63.0 62.0 66.0 65.0 64.0 65.0 63.0 65.0 07:41:01 INFO - PROCESS | 10227 | -------- Summary: end -------- 07:41:01 INFO - PROCESS | 10227 | 07:41:02 INFO - TEST-INFO | 10227: exit 0 07:41:02 INFO - TEST-OK | kraken | took 59177ms 07:41:02 INFO - SUITE-END | took 1169s 07:41:02 INFO - Completed test suite (00:19:29) 07:41:02 INFO - javascript benchmark 07:41:02 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"lowerIsBetter": false, "subtests": [{"lowerIsBetter": false, "replicates": [3057.847107644618, 3069.6009518762557, 3107.5804766356537, 3112.517559778235, 3146.9929622520795, 5209.166533354664, 5259.211118332252, 5259.289995850559, 5266.157414813631, 5288.524032837044, 5300.469953004697, 5364.409914909357, 5371.623986320959, 5374.6506477078965, 5391.514763671269, 4744.098621261966, 4745.430548334205, 4789.473157952622, 4866.099771542258, 4892.730899800509, 4695.8356457524, 4825.2279635258365, 4841.709497430148, 4892.412910450751, 4899.6325275604295, 4792.472827988919, 4811.374521312242, 4824.276358546211, 4870.439899411577, 4880.487548807378, 4688.718676879398, 4705.717656940595, 4708.693934894221, 4708.905821883577, 4738.95261047392, 4662.8368007119925, 4690.906181876378, 4697.459792123916, 4722.645801564862, 4749.905001899977, 5216.087184742692, 5219.138842091051, 5227.45111763267, 5238.895222095575, 5239.869003274911, 5636.464535869086, 5658.0381335173115, 5662.66024038559, 5667.433256674341, 5672.574556908207, 5604.8318550443555, 5700.857478563069, 5702.6293290935955, 5706.029974904276, 5767.106098554731, 5346.198070289449, 5352.892942141136, 5358.0, 5365.7585408656705, 5374.865628359284, 5822.272215973004, 5838.854028649318, 5844.0, 5845.824625261249, 5847.649141051465, 5370.0, 5541.750621222055, 5591.52472039873, 5591.916121258185, 5649.717514124277, 5589.413111623302, 5611.859703507445, 5615.0454422748235, 5618.606697531133, 5622.91565626516, 5534.252875861787, 5543.168524721244, 5546.944530554723, 5549.944500555023, 5587.664740115606, 5485.890282194334, 5570.164475328652, 5616.045272303718, 5622.8313150605545, 5648.096304591246, 4323.113761678848, 4342.630876375543, 4343.2182207203, 4346.0, 4383.627391671744, 3758.1356288053903, 3857.3442514772555, 3878.340682083996, 3931.5282166139673, 3950.2692001979726, 5316.202569614588, 5331.680099194061, 5343.572514198855, 5373.892522149535, 5387.191921211771, 5650.434956504317, 5680.77276908919, 5683.5737319700365, 5684.8294551163535, 5684.9431505684415, 5189.6886186828915, 5362.570994320445, 5367.605367605402, 5379.865503362369, 5411.729413529308, 4883.8290659826735, 4904.43598986114, 4904.901901962012, 4918.262260660929, 4950.579200767903, 5856.355800861902, 5870.677112758839, 5879.52963762898, 5882.882342353129, 5885.234919460443, 5565.471280228372, 5657.8019769307875, 5683.9715801420725, 5713.857153571111, 5783.3638299787835, 5923.644581325134, 5934.762609495572, 5939.3466718661775, 5939.910901336397, 5943.0, 5621.550275977994, 5648.435156484319, 5648.5481161507805, 5648.604597678123, 5652.660840349592, 5535.446455354432, 5690.260266165372, 5712.11462223356, 5713.114467257582, 5784.045632470596, 5571.721413929206, 5582.720863956867, 5586.804461843816, 5588.888222235451, 5595.692236927008, 5514.95215908976, 5538.16927460868, 5561.888762224814, 5564.554835613222, 5565.805196818092, 5355.812546560852, 5475.863103422446, 5509.972450137724, 5511.283533140827, 5557.888842223052, 5535.308086489189, 5537.889242215214, 5557.499825015768, 5562.972185139049, 5568.359638641608, 5285.894282114413, 5443.673379597237, 5453.727313634223, 5458.2904222450825, 5518.724063796713], "unit": "score", "name": "dojo.html", "value": 5220.896196227691}, {"lowerIsBetter": false, "replicates": [532.989340213196, 559.4405594405594, 570.8943845388601, 585.0463744097123, 600.768704048941, 29543.26141846452, 38851.41722874156, 39555.2088958221, 39610.80194599023, 39691.20617587647, 40672.59327406725, 41340.379894301535, 41361.17277654445, 41377.37933930993, 41447.171056578925, 7451.776446706607, 8929.330300227493, 9165.450072995609, 9169.174774270314, 10133.746656333613, 10208.958208358357, 10450.947745261263, 10457.84313235302, 10458.633947811828, 10463.215258855578, 10115.0, 10129.088382045615, 10224.795504089914, 10230.386176829414, 10230.641927532537, 10379.117774989098, 10512.0, 10512.78974420511, 10519.211059170517, 10520.158387329071, 10236.43699596522, 10735.141188704885, 10736.355818650905, 10745.892541074645, 10747.19396045292, 41340.793296033626, 41934.370984435256, 41938.0, 41970.37044444336, 41981.37027944583, 3478.773879697837, 3495.4582039783872, 3687.0413692439893, 3804.904877378088, 3812.1803812180515, 28261.15216543507, 29499.70500294991, 31169.84415077933, 31222.582395968584, 31677.36645267105, 4300.65594752419, 4311.8706438806885, 4343.153085148398, 4395.670324725626, 4397.142557201347, 330511.0, 330721.0, 331373.0, 331558.9999999976, 332549.0, 45688.543114569096, 62881.37118628847, 63403.0, 63412.68293658502, 63547.0, 45348.0, 45439.54560454419, 45502.77248613802, 45705.771471142434, 45855.0, 14430.278486075655, 15386.384544618313, 15675.686486270211, 15676.451324203597, 15684.058956462648, 11793.52825886955, 11921.225120367322, 11964.0, 11967.940160299317, 11976.940115299367, 14840.480583179537, 14883.330250138553, 14896.478623248135, 14956.925215373854, 14967.476138335323, 5957.6127551709, 6048.968313740352, 6118.938810611926, 6132.264128304632, 6154.692265386713, 904.8778414914034, 973.3721749471551, 995.5271246158162, 1000.8798944126606, 1005.2962925951863, 31889.840550797562, 31944.520832187536, 32002.519962200586, 32141.67858321387, 32650.34699306048, 1131.8811524789778, 1139.6979800352913, 1151.7638884028754, 1183.650823007215, 1202.3988005997, 16303.266353014144, 16458.588535286715, 16533.0, 16579.419720309972, 16703.582410439838, 387776.0, 392165.0, 392705.0, 393003.0, 393046.0, 55387.29208017283, 56835.0, 56837.715811420676, 56902.43097569054, 56925.0, 1253.291890082119, 1324.3378310844578, 1415.8408427148681, 1420.843707192208, 1429.8856091512655, 28066.158015259574, 28966.855165724035, 30848.537271941386, 31023.224419388793, 31711.52432713465, 45883.0, 46233.537664624266, 46265.53734462612, 46365.84085397892, 46402.071958559965, 247975.0, 247984.0, 248153.0, 249267.0, 249838.0, 29754.851225743732, 34616.48075278822, 34651.30697386088, 34957.0, 35134.82432587821, 39922.201555969295, 40108.59891401049, 40667.7966610165, 40972.0, 41403.378949315185, 37758.483033932134, 38103.0, 38344.23311533698, 38605.613943860204, 38693.22613547657, 37193.81403092967, 37775.62224377831, 37844.432333514465, 38140.0, 38324.041898952746, 39174.90032934718, 39823.402648960866, 40032.799836001795, 40343.79828100958, 40361.59638403579, 33077.00768976934, 34155.0, 34535.30929381348, 34863.0, 34966.47550286799, 23948.640770388807, 24500.142495012587, 24541.0, 28526.313685515113, 31229.375412492078], "unit": "score", "name": "ext.html", "value": 19097.14675036395}, {"lowerIsBetter": false, "replicates": [360.12848905648326, 360.7474767662636, 364.9781013139211, 365.78235949609973, 372.4190263189423, 17229.396971105998, 17390.0, 18485.53786155347, 18509.074546272685, 18514.166862491187, 17364.56588585286, 17622.64754704905, 17788.46634600964, 17802.19890104945, 17805.73291400627, 5361.571074314055, 5616.0, 5621.662700237999, 5624.718764061801, 5625.54995600351, 4046.534648515414, 4179.017930786263, 4183.226103170908, 5460.808871689492, 5667.829965101033, 5772.278465191851, 5797.1594118852745, 5806.303243610751, 5837.357890632027, 5842.737076831553, 5600.719964001804, 5774.249347584808, 5898.115282707607, 5920.407959204088, 5945.554083443759, 3641.508396366483, 5085.516875896784, 5195.870103247411, 5227.2159176123505, 5257.553107985826, 21242.575148496944, 21329.466763331042, 21564.245251416283, 21624.135034598596, 21804.0, 2539.5682733935278, 2617.0, 2706.188143556925, 3042.6196725409322, 3128.3743251349592, 13481.258530780804, 13498.527551535748, 13539.0, 13654.590362289147, 14358.641033974234, 1990.2735501541977, 1995.4213278149318, 2004.3285499357733, 2023.7267968824167, 2038.2458490358515, 67649.32350676479, 69298.3070169302, 69364.30635693629, 69533.65233173802, 70769.29230707628, 10666.466676666136, 10727.678169654922, 10763.408012559385, 10860.728481788019, 11087.279326843729, 13788.103773254707, 14002.0, 14026.509072182425, 14046.438142474391, 14049.086809357359, 8373.995120585569, 8581.78545536354, 8619.22426981562, 8685.174908383693, 8747.300215982707, 8653.6538538459, 8674.522901240367, 8691.217790398894, 8821.867671984925, 8846.955765221133, 6457.128287681103, 6585.374389432996, 6603.471722262208, 6606.504512161511, 6621.304762999912, 1684.8062472815784, 1763.867709921761, 1830.6979348407363, 1858.5353661584604, 1863.9627207455776, 1056.8358197150696, 1066.386827574148, 1073.5491093740648, 1118.8489553910117, 1204.313541281461, 17763.822361776216, 18144.025680774957, 18396.724049139273, 18808.871467711982, 18888.622227555374, 924.3390975452584, 979.8481235408523, 1041.9895801042044, 1066.7279843639978, 1135.6593022093339, 10357.791029297308, 10582.735431614117, 10640.840387394195, 10652.254342195973, 10791.190660700478, 434317.0, 436509.0, 436660.0, 459602.0, 516785.0, 78851.60574197093, 82225.0, 82864.0, 83910.0, 84548.0, 1107.5182295701557, 1114.7547539541288, 1116.9776604467866, 1122.6688127002553, 1124.6232512108536, 16368.0, 16462.917685411496, 16496.42262520806, 16555.50333489997, 16589.751153732945, 34143.4878476828, 35115.29769404547, 35650.28699426049, 36475.45286820753, 36721.26557468889, 51812.48187518077, 52910.20634690406, 53009.0, 53038.73480632572, 53798.462015379344, 7645.6559454823555, 7922.841543168989, 8019.198080192167, 8190.385721071063, 8265.669373225244, 9128.589213485277, 9607.807843842944, 11983.520659173535, 12647.177933434665, 13018.218906865619, 11307.151963602599, 11491.770164596828, 11500.827487587525, 11513.712157196138, 11640.592579259684, 10945.507452164513, 11126.60193596706, 11202.383868886964, 11586.188966772244, 11747.0, 11171.832422513831, 11632.53469861196, 11645.941770291432, 11816.645500634995, 12020.218685785396, 8057.919420805717, 8169.305609023299, 8193.754187374388, 8333.583320833814, 8455.239028487465, 9919.851202231828, 11157.0, 11278.605248816251, 11315.547378104784, 11461.140414468782], "unit": "score", "name": "jquery.html", "value": 9058.345171073712}, {"lowerIsBetter": false, "replicates": [1237.870023647517, 1304.1653341861208, 1312.8752768487002, 1328.5018118205674, 1806.1691621853938, 7842.529448233103, 8045.316148127409, 8086.0, 8093.716719914804, 8103.10865804761, 7953.403494737903, 8103.39224558159, 8107.91892081079, 8113.391495637821, 8119.228673276044, 2002.899855007251, 2039.6736522156457, 2306.4695120122383, 2341.356127065054, 2364.7871691547757, 2367.9644805327935, 2378.702662167229, 2379.7144342678903, 2385.3321070100315, 2385.940351491209, 2279.7720227977234, 2281.7604151564096, 2334.48641298914, 2336.5210131922913, 2337.976620233793, 2276.5902137615303, 2291.175176936302, 2301.102569997702, 2351.811855051592, 2355.9057637694473, 2293.5183611441616, 2302.458922153293, 2320.5706944215203, 2328.8136949044206, 2346.741858395575, 8162.347012239006, 8214.1375155609, 8230.176982301782, 8240.0, 8242.0, 4912.508749125094, 5047.747612619354, 5047.7476126193915, 5049.520295571915, 5049.545540901337, 3363.7477189210663, 3431.159365955357, 3486.9302613947834, 3505.1762835733584, 3510.5436293281964, 1171.133361312631, 1171.8535183102113, 1182.1665725663386, 1196.342011893455, 1221.2611370121037, 11276.041536469327, 11291.153163512769, 11292.096632269398, 11308.604198853083, 11325.660230193107, 4442.511323754385, 4517.728936263835, 4554.0891821635805, 4586.312053192048, 4611.654125940568, 9582.089701478348, 9593.28050396223, 9597.040295970348, 9601.567929443192, 9618.470984095802, 5039.672421292605, 5062.772175252123, 5067.366579177603, 5080.339555857715, 5080.441151473335, 4102.3026085564925, 4576.542345765397, 4660.766961651904, 4694.413198350207, 4704.741239231875, 3883.902902427462, 3939.468171796828, 3971.8808435746973, 3998.660113890294, 4006.677796327205, 1237.900967922564, 1239.8078297863665, 1247.9625611231677, 1250.0499620288465, 1253.7805883970268, 1265.0638527489775, 1296.7212049409234, 1321.9735605288033, 1388.5556621881103, 1410.2314238739912, 7731.226877312336, 7744.186860379579, 7799.727009554638, 7867.567283799332, 7869.0, 484.5275856040332, 491.7172625740214, 491.9508049195052, 492.202631736589, 493.043495618499, 5746.396628354046, 5754.510866576388, 5756.481916627524, 5780.855478612984, 5791.218185544897, 9517.381370210915, 10126.848097278547, 10158.847617285746, 10260.281780275309, 10292.639757608447, 9985.650502232387, 10002.099811017044, 10102.747431314128, 10127.696169114792, 10133.442660653587, 7604.771856844303, 7808.258215469521, 7828.2954534092205, 7901.933239012775, 7940.523568585903, 7480.401567874448, 7480.850382992418, 7495.17553069151, 7503.13713922884, 7511.06111736033, 8811.867821982547, 8892.110788921056, 9011.864822027545, 9170.266378689555, 9195.862062069207, 9152.63389464414, 9208.539573021188, 9255.86116208244, 9371.0, 9416.858747118935, 6378.45783108441, 6973.755918542826, 7178.318059784312, 7311.488195826454, 7382.335589796944, 7877.921220787719, 7893.605319733875, 7896.84206315859, 7919.643616037177, 7928.960355198187, 7044.401225895651, 7162.89255661176, 7193.676284567312, 7269.636518174176, 7285.125784905846, 6857.931420685929, 6945.409640180641, 7036.050133231948, 7129.500934934505, 7131.072960515307, 7200.135983681992, 7505.774826755206, 7506.211847755907, 7511.624418779148, 7515.13575938774, 6956.582605043714, 6972.477064220305, 6984.895226571504, 7003.29967003316, 7013.333733295329, 6765.9661701691175, 6882.174139103339, 7091.9290807091265, 7103.538270012433, 7105.3960413363375], "unit": "score", "name": "mootools.html", "value": 4620.342773143017}, {"lowerIsBetter": false, "replicates": [344.06586118687756, 344.5314372453463, 345.9117924929143, 349.4310545650032, 352.26728404917776, 5969.044952807551, 5977.193078934342, 5989.5807293489415, 5991.400859914006, 6001.309849367313, 5890.764369425228, 5953.88092238155, 6001.639901605907, 6004.849878753033, 6009.519238460924, 4348.239058164824, 4488.955110448903, 4568.862934111982, 4583.289590113538, 4588.885277868063, 4576.0, 4602.217623004098, 4605.30920361945, 4626.537346265363, 4631.073785242948, 4573.245414506602, 4581.977090114561, 4583.724976501404, 4586.7477288749105, 4601.861944141681, 4315.482142142947, 4428.557144285562, 4537.727736335797, 4555.977220113911, 4556.863294101182, 3956.5054368203973, 3958.9010274743073, 3962.7622342659242, 3966.107625784204, 3967.226390853785, 5809.767609295665, 5813.0, 5813.418658134153, 5816.360200377955, 5820.0, 5278.81524146653, 5282.4189339173045, 5283.260343551906, 5283.947160528384, 5289.20661900718, 6288.717007734663, 6303.149074874925, 6304.87390252197, 6305.968470157666, 6310.7791227306825, 4312.180685669713, 4382.167388196264, 4407.625351845097, 4409.09613529229, 4414.514403415654, 6569.310222426672, 6584.209894812653, 6585.5719378240265, 6610.966945165292, 6611.86776264472, 4470.128324976663, 4511.1654343946475, 4512.368268442421, 4512.796924138422, 4517.322401639714, 4564.383808185852, 4566.223741963874, 4566.223741963874, 4575.062112266977, 4584.426946631671, 5265.52610265078, 5268.183431568036, 5273.1035723927025, 5280.339957505312, 5284.603654725911, 6200.3799620037635, 6348.809535713936, 6358.078078678565, 6362.936370636235, 6369.267534233622, 1589.5390336802197, 1599.4561848971405, 1611.7421212605927, 1612.5001249612424, 1616.5554472519916, 1021.300409219672, 1070.9732256693644, 1084.7993121272432, 1086.6577028236081, 1111.2998810749177, 5977.581569290195, 6032.095185722177, 6035.6076855004285, 6045.909311360333, 6046.3349031606485, 6404.775832845921, 6439.839004024937, 6478.34802125455, 6489.805305840738, 6504.447121994684, 6081.604695694766, 6087.512998960073, 6094.695265236809, 6103.023516237381, 6103.511719062464, 3472.3749725049734, 3511.1924257420937, 3513.0514761014383, 3513.0865974846215, 3513.4905438711244, 6541.869162616721, 6713.899291510631, 6725.932740672629, 6728.058071869942, 6732.427743641845, 6631.469482441393, 6639.203295604559, 6639.86720265592, 6642.501812364092, 6646.634435106115, 6692.665366731741, 6738.764143255061, 6776.72893084281, 6786.117804685458, 6788.422984046411, 6454.67726613658, 6473.255575608677, 6480.708368123352, 6487.124238227968, 6494.545381823227, 6305.274893387319, 6394.104825324552, 6401.743930242738, 6631.767888123893, 6635.0710900473005, 6780.660966951534, 6860.0738900247825, 6871.381575658214, 6871.553349032297, 6871.690773915086, 4491.505934347285, 4534.977325113353, 4536.637069034403, 4536.8638940831825, 4540.704854184468, 6610.4050635443045, 6613.66931653425, 6615.768448104293, 6619.106420633153, 6623.701933412912, 6304.621722696653, 6406.839829004312, 6426.036094585849, 6431.678416079271, 6437.098806167047, 6355.269144048309, 6390.648514331757, 6393.232812062396, 6396.48828093742, 6396.6481843497195, 6282.2147231596055, 6282.811515654537, 6284.968575157095, 6287.402696743802, 6298.0552917062805, 6402.9679851602305, 6404.839879003062, 6406.103145559532, 6407.359264073555, 6408.93591064102, 5991.490723288395, 6090.725917333642, 6165.660888651168, 6272.372762723691, 6280.277768056732], "unit": "score", "name": "prototype.html", "value": 4787.70420352909}, {"lowerIsBetter": false, "replicates": [756.8524137793125, 762.5539059650105, 772.6291380137537, 834.6786487202427, 862.4997501449158, 14050.227237501933, 14139.434422623082, 14251.50119745809, 14293.999999999987, 14317.140971541701, 12092.818607720892, 13543.796843047363, 13624.250666213355, 13636.38636261368, 13673.24797136157, 821.1131977464339, 832.5129799067553, 834.3325339728193, 839.9580020998956, 841.6212704283066, 832.1470492744954, 839.1734141870253, 839.3159574946429, 840.7771940435789, 846.8772028055928, 866.384866744612, 868.7480630617114, 870.2081106193365, 871.9520426376547, 873.4409977614332, 863.1541089732035, 868.7784614923186, 869.7303835810919, 869.9956500217459, 870.3646338173106, 625.327772644409, 626.4768917953514, 627.7300760672908, 629.408356145222, 631.8894193516162, 12829.23024618526, 12841.165324253894, 12963.092583519157, 12995.155314904501, 13014.934925325313, 11940.70148246292, 12020.63938081859, 12027.57903473383, 12141.635750927398, 12311.138220324581, 10132.848007279898, 10409.9479502602, 10410.79178416435, 10540.736481587945, 10601.628942986958, 3671.375866102769, 3729.272791805599, 3739.738218324718, 3789.412641040643, 3813.2182902505197, 43125.56874431247, 43953.12093758139, 49048.0, 50249.24626130648, 50278.7486062571, 9858.901410985942, 9934.453605051647, 9966.152877005536, 10122.240831937634, 10286.919873413333, 18575.349862754738, 18712.157952892154, 18731.719024214646, 18768.53078673044, 19034.714479282822, 7973.162817904153, 8203.097659257477, 8261.38039647029, 8617.181367770052, 8746.825063498822, 4718.127146477913, 4812.687175333592, 4820.132376172252, 4872.975635121802, 4974.925376119361, 3141.9842900785807, 3154.41643295991, 3170.3342298117655, 3181.761367897417, 3190.9042728718177, 605.6003037994902, 611.4450219753588, 613.8710870717199, 616.2604874150948, 631.26457676806, 728.2098922668857, 730.3682314797662, 732.3372348025046, 736.694271877165, 740.8481261341412, 9384.483853387992, 9664.226861851035, 9824.803503929881, 9913.157381622499, 9990.100890919852, 579.2990481517411, 615.8460384903774, 690.068407649679, 691.8443350246155, 703.6657587645827, 4343.717658352197, 4477.171723231213, 4482.28283474649, 4575.359449677047, 4615.399998000238, 60998.0, 61007.0, 61173.0, 61777.0, 61815.381846180964, 50698.49301507012, 50725.23912141321, 51674.48325516697, 51836.0, 52062.73968630133, 49733.75133124311, 49971.0, 50539.747301264, 50835.49164508308, 51915.48084519182, 9899.802003960025, 9949.303548751517, 9959.0, 10106.898931010595, 10120.493975301353, 36832.26335473222, 37566.0, 38640.42039369355, 39363.80318098391, 39609.603903961746, 45649.31526027179, 46861.76569117133, 50527.24209136792, 50690.0, 50990.74504627453, 12015.219010764273, 12019.4591243396, 12043.638690839289, 12102.2540186186, 12325.220093216007, 13394.93302533481, 13565.660858478617, 13674.384652690454, 13694.863051369757, 14261.572152835432, 11321.0, 11479.139064570358, 11593.536258549564, 11962.282263064244, 12341.13612047184, 10809.35143891369, 11227.684321068651, 11393.658190254306, 11854.466549005143, 11901.523939042341, 10874.67375978722, 10945.343279403261, 11016.0, 11265.943670281596, 11295.604653837076, 9723.270754693567, 9828.754281143028, 9929.602815887283, 9939.353941993748, 9984.700458986243, 9883.802323953625, 10158.492075396349, 10169.491525423848, 10170.847437288594, 10212.489375531342], "unit": "score", "name": "yui.html", "value": 6611.976012667876}], "name": "dromaeo_css", "value": 7136.562126902909}, {"lowerIsBetter": true, "subtests": [{"lowerIsBetter": true, "replicates": [110.0, 111.0, 107.0, 110.0, 111.0, 112.0, 100.0, 111.0, 110.0, 111.0], "unit": "score", "name": "ai-astar", "value": 109.3}, {"lowerIsBetter": true, "replicates": [150.0, 122.0, 152.0, 168.0, 129.0, 149.0, 148.0, 129.0, 176.0, 126.0], "unit": "score", "name": "audio-beat-detection", "value": 144.9}, {"lowerIsBetter": true, "replicates": [161.0, 161.0, 160.0, 158.0, 162.0, 161.0, 161.0, 164.0, 163.0, 161.0], "unit": "score", "name": "audio-dft", "value": 161.2}, {"lowerIsBetter": true, "replicates": [73.0, 72.0, 98.0, 96.0, 73.0, 71.0, 72.0, 106.0, 94.0, 72.0], "unit": "score", "name": "audio-fft", "value": 82.7}, {"lowerIsBetter": true, "replicates": [92.0, 92.0, 142.0, 92.0, 93.0, 93.0, 141.0, 91.0, 92.0, 132.0], "unit": "score", "name": "audio-oscillator", "value": 106.0}, {"lowerIsBetter": true, "replicates": [116.0, 117.0, 117.0, 116.0, 116.0, 117.0, 118.0, 117.0, 117.0, 117.0], "unit": "score", "name": "imaging-gaussian-blur", "value": 116.8}, {"lowerIsBetter": true, "replicates": [146.0, 145.0, 146.0, 144.0, 146.0, 145.0, 145.0, 145.0, 146.0, 145.0], "unit": "score", "name": "imaging-darkroom", "value": 145.3}, {"lowerIsBetter": true, "replicates": [95.0, 95.0, 96.0, 95.0, 95.0, 94.0, 95.0, 95.0, 95.0, 95.0], "unit": "score", "name": "imaging-desaturate", "value": 95.0}, {"lowerIsBetter": true, "replicates": [57.0, 55.0, 62.0, 55.0, 59.0, 57.0, 55.0, 65.0, 55.0, 56.0], "unit": "score", "name": "json-parse-financial", "value": 57.6}, {"lowerIsBetter": true, "replicates": [59.0, 59.0, 59.0, 58.0, 59.0, 59.0, 63.0, 59.0, 60.0, 60.0], "unit": "score", "name": "json-stringify-tinderbox", "value": 59.5}, {"lowerIsBetter": true, "replicates": [77.0, 78.0, 77.0, 78.0, 77.0, 77.0, 77.0, 78.0, 77.0, 78.0], "unit": "score", "name": "stanford-crypto-aes", "value": 77.4}, {"lowerIsBetter": true, "replicates": [109.0, 110.0, 110.0, 109.0, 116.0, 114.0, 109.0, 108.0, 110.0, 107.0], "unit": "score", "name": "stanford-crypto-ccm", "value": 110.2}, {"lowerIsBetter": true, "replicates": [126.0, 124.0, 147.0, 136.0, 137.0, 125.0, 134.0, 134.0, 135.0, 138.0], "unit": "score", "name": "stanford-crypto-pbkdf2", "value": 133.6}, {"lowerIsBetter": true, "replicates": [66.0, 64.0, 63.0, 62.0, 66.0, 65.0, 64.0, 65.0, 63.0, 65.0], "unit": "score", "name": "stanford-crypto-sha256-iterative", "value": 64.3}], "name": "kraken", "value": 1463.7999999999997}]} 07:41:02 INFO - Return code: 0 07:41:02 INFO - Validating PERFHERDER_DATA against /builds/slave/test-pgo/build/tests/talos/treeherder-schemas/performance-artifact.json 07:41:02 ERROR - # TBPL SUCCESS # 07:41:02 INFO - Running post-action listener: _resource_record_post_action 07:41:02 INFO - Running post-run listener: _resource_record_post_run 07:41:03 INFO - Total resource usage - Wall time: 1188s; CPU: 13.0%; Read bytes: 4096; Write bytes: 545869824; Read time: 12; Write time: 564108 07:41:03 INFO - install - Wall time: 17s; CPU: 15.0%; Read bytes: 0; Write bytes: 249319424; Read time: 0; Write time: 385100 07:41:03 INFO - run-tests - Wall time: 1171s; CPU: 13.0%; Read bytes: 4096; Write bytes: 296550400; Read time: 12; Write time: 179008 07:41:03 INFO - Running post-run listener: _upload_blobber_files 07:41:03 INFO - Blob upload gear active. 07:41:03 INFO - Preparing to upload files from /builds/slave/test-pgo/build/blobber_upload_dir. 07:41:03 INFO - Files from /builds/slave/test-pgo/build/blobber_upload_dir are to be uploaded with branch at the following location(s): https://blobupload.elasticbeanstalk.com 07:41:03 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/python', '/builds/slave/test-pgo/build/venv/bin/blobberc.py', '-u', 'https://blobupload.elasticbeanstalk.com', '-a', '/builds/slave/test-pgo/oauth.txt', '-b', 'Mozilla-Inbound', '-d', '/builds/slave/test-pgo/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test-pgo/build/uploaded_files.json'] 07:41:03 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/python /builds/slave/test-pgo/build/venv/bin/blobberc.py -u https://blobupload.elasticbeanstalk.com -a /builds/slave/test-pgo/oauth.txt -b Mozilla-Inbound -d /builds/slave/test-pgo/build/blobber_upload_dir --output-manifest /builds/slave/test-pgo/build/uploaded_files.json 07:41:04 INFO - (blobuploader) - INFO - Open directory for files ... 07:41:04 INFO - (blobuploader) - INFO - Uploading /builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs_raw.log ... 07:41:04 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 07:41:04 INFO - (blobuploader) - INFO - Uploading, attempt #1. 07:41:05 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_raw.log: uploaded 07:41:05 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 07:41:05 INFO - (blobuploader) - INFO - Done attempting. 07:41:05 INFO - (blobuploader) - INFO - Uploading /builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs_errorsummary.log ... 07:41:05 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 07:41:05 INFO - (blobuploader) - INFO - Uploading, attempt #1. 07:41:05 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_errorsummary.log: uploaded 07:41:05 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 07:41:05 INFO - (blobuploader) - INFO - Done attempting. 07:41:05 INFO - (blobuploader) - INFO - Iteration through files over. 07:41:05 INFO - Return code: 0 07:41:05 INFO - rmtree: /builds/slave/test-pgo/build/uploaded_files.json 07:41:05 INFO - retry: Calling remove with args: ('/builds/slave/test-pgo/build/uploaded_files.json',), kwargs: {}, attempt #1 07:41:05 INFO - Setting buildbot property blobber_files to {"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/9cd215e18581f606c64df349badb8aa7df95c53bc1eda1fff1e7aa22475ba029a709b904d53b4951961a54a46438082e9941a4bb4aa5e4ccee8bfdee79251cc8", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/0179369b91b131a3c73655cba3bf164ec9644c71cce372605c3af715a74d7ffbb345f6b5714e69b0515285b0823e49c4995f2427b972f393d641bed5f0fdb026"} 07:41:05 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test-pgo/properties/blobber_files 07:41:05 INFO - Writing to file /builds/slave/test-pgo/properties/blobber_files 07:41:05 INFO - Contents: 07:41:05 INFO - blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/9cd215e18581f606c64df349badb8aa7df95c53bc1eda1fff1e7aa22475ba029a709b904d53b4951961a54a46438082e9941a4bb4aa5e4ccee8bfdee79251cc8", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/0179369b91b131a3c73655cba3bf164ec9644c71cce372605c3af715a74d7ffbb345f6b5714e69b0515285b0823e49c4995f2427b972f393d641bed5f0fdb026"} 07:41:05 INFO - Running post-run listener: copy_logs_to_upload_dir 07:41:05 INFO - Copying logs to upload dir... 07:41:05 INFO - mkdir: /builds/slave/test-pgo/build/upload/logs 07:41:05 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1226.301146 ========= master_lag: 0.01 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 26 secs) (at 2016-03-17 07:41:05.828376) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-03-17 07:41:05.832071) ========= bash -c 'for file in `ls -1`; do cat $file; done' in dir /builds/slave/test-pgo/properties (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', 'for file in `ls -1`; do cat $file; done'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test-pgo/properties SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=32c5991c409366f7fec8a718000001d2-1458224437.505172-2111584463 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/9cd215e18581f606c64df349badb8aa7df95c53bc1eda1fff1e7aa22475ba029a709b904d53b4951961a54a46438082e9941a4bb4aa5e4ccee8bfdee79251cc8", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/0179369b91b131a3c73655cba3bf164ec9644c71cce372605c3af715a74d7ffbb345f6b5714e69b0515285b0823e49c4995f2427b972f393d641bed5f0fdb026"} build_url:https://queue.taskcluster.net/v1/task/YtI84bJLSuynT4NIUW8ViQ/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.011258 build_url: 'https://queue.taskcluster.net/v1/task/YtI84bJLSuynT4NIUW8ViQ/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2' blobber_files: '{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/9cd215e18581f606c64df349badb8aa7df95c53bc1eda1fff1e7aa22475ba029a709b904d53b4951961a54a46438082e9941a4bb4aa5e4ccee8bfdee79251cc8", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/0179369b91b131a3c73655cba3bf164ec9644c71cce372605c3af715a74d7ffbb345f6b5714e69b0515285b0823e49c4995f2427b972f393d641bed5f0fdb026"}' ========= master_lag: 0.01 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-03-17 07:41:05.856924) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-03-17 07:41:05.857233) ========= rm -f oauth.txt in dir /builds/slave/test-pgo/. (timeout 1200 secs) watching logfiles {} argv: ['rm', '-f', 'oauth.txt'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test-pgo SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=32c5991c409366f7fec8a718000001d2-1458224437.505172-2111584463 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004470 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-03-17 07:41:05.940540) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-03-17 07:41:05.940871) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-03-17 07:41:05.941633) ========= ========= Total master_lag: 0.26 =========