builder: fx-team_ubuntu64_hw_test-dromaeojs-e10s-pgo slave: talos-linux64-ix-009 starttime: 1455195742.7 results: success (0) buildid: 20160211023003 builduid: a33aefedd3df4cac875f4ba48a330e01 revision: ed1086f28ad16013658981a24fbd154913632710 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-02-11 05:02:22.704584) ========= master: http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-02-11 05:02:22.705041) ========= ========= Started set props: basedir (results: 0, elapsed: 0 secs) (at 2016-02-11 05:02:22.705328) ========= 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=aa52b8aba932b19cc50b5275000001de-1455194244.947672-544072490 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False /builds/slave/test-pgo program finished with exit code 0 elapsedTime=0.006458 basedir: '/builds/slave/test-pgo' ========= master_lag: 0.02 ========= ========= Finished set props: basedir (results: 0, elapsed: 0 secs) (at 2016-02-11 05:02:22.731535) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-02-11 05:02:22.731854) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-02-11 05:02:22.745967) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-02-11 05:02:22.746335) ========= 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=aa52b8aba932b19cc50b5275000001de-1455194244.947672-544072490 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004545 ========= master_lag: 0.04 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-02-11 05:02:22.795535) ========= ========= Started set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2016-02-11 05:02:22.795858) ========= script_repo_url: https://hg.mozilla.org/build/mozharness ========= Finished set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2016-02-11 05:02:22.796239) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-02-11 05:02:22.796509) ========= 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=aa52b8aba932b19cc50b5275000001de-1455194244.947672-544072490 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2016-02-11 05:02:22-- 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% 84.5M=0s 2016-02-11 05:02:23 (84.5 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.189295 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-02-11 05:02:23.003662) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-02-11 05:02:23.003963) ========= 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=aa52b8aba932b19cc50b5275000001de-1455194244.947672-544072490 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.020364 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-02-11 05:02:23.053685) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2016-02-11 05:02:23.054059) ========= bash -c 'python archiver_client.py mozharness --repo integration/fx-team --rev ed1086f28ad16013658981a24fbd154913632710 --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/fx-team --rev ed1086f28ad16013658981a24fbd154913632710 --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=aa52b8aba932b19cc50b5275000001de-1455194244.947672-544072490 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2016-02-11 05:02:23,208 truncating revision to first 12 chars 2016-02-11 05:02:23,208 Setting DEBUG logging. 2016-02-11 05:02:23,208 attempt 1/10 2016-02-11 05:02:23,208 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/integration/fx-team/ed1086f28ad1?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-02-11 05:02:24,213 unpacking tar archive at: fx-team-ed1086f28ad1/testing/mozharness/ program finished with exit code 0 elapsedTime=1.270823 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2016-02-11 05:02:24.340021) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-02-11 05:02:24.340318) ========= echo ed1086f28ad16013658981a24fbd154913632710 in dir /builds/slave/test-pgo/. (timeout 1200 secs) watching logfiles {} argv: ['echo', u'ed1086f28ad16013658981a24fbd154913632710'] 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=aa52b8aba932b19cc50b5275000001de-1455194244.947672-544072490 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False ed1086f28ad16013658981a24fbd154913632710 program finished with exit code 0 elapsedTime=0.004548 script_repo_revision: 'ed1086f28ad16013658981a24fbd154913632710' ========= master_lag: 0.04 ========= ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-02-11 05:02:24.388013) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-02-11 05:02:24.388287) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-02-11 05:02:24.398425) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 43 secs) (at 2016-02-11 05:02:24.398708) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Fx-Team --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Fx-Team 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-e10s', '--add-option', '--webServer,localhost', '--branch-name', 'Fx-Team', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Fx-Team'] 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=aa52b8aba932b19cc50b5275000001de-1455194244.947672-544072490 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 05:02:24 INFO - MultiFileLogger online at 20160211 05:02:24 in /builds/slave/test-pgo 05:02:24 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Fx-Team --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Fx-Team 05:02:24 INFO - Dumping config to /builds/slave/test-pgo/logs/localconfig.json. 05:02:24 INFO - {'append_to_log': False, 05:02:24 INFO - 'base_work_dir': '/builds/slave/test-pgo', 05:02:24 INFO - 'blob_upload_branch': 'Fx-Team', 05:02:24 INFO - 'blob_uploader_auth_file': '/builds/slave/test-pgo/oauth.txt', 05:02:24 INFO - 'branch': 'Fx-Team', 05:02:24 INFO - 'buildbot_json_path': 'buildprops.json', 05:02:24 INFO - 'config_files': ('talos/linux_config.py',), 05:02:24 INFO - 'default_actions': ('clobber', 05:02:24 INFO - 'read-buildbot-config', 05:02:24 INFO - 'download-and-extract', 05:02:24 INFO - 'populate-webroot', 05:02:24 INFO - 'create-virtualenv', 05:02:24 INFO - 'install', 05:02:24 INFO - 'run-tests'), 05:02:24 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 05:02:24 INFO - 'download_minidump_stackwalk': True, 05:02:24 INFO - 'download_symbols': 'ondemand', 05:02:24 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 05:02:24 INFO - 'tooltool.py': '/tools/tooltool.py', 05:02:24 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 05:02:24 INFO - '/tools/misc-python/virtualenv.py')}, 05:02:24 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 05:02:24 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 05:02:24 INFO - 'installer_path': 'installer.exe', 05:02:24 INFO - 'log_level': 'info', 05:02:24 INFO - 'log_name': 'talos', 05:02:24 INFO - 'log_to_console': True, 05:02:24 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 05:02:24 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 05:02:24 INFO - 'opt_config_files': (), 05:02:24 INFO - 'pip_index': False, 05:02:24 INFO - 'sps_profile': False, 05:02:24 INFO - 'sps_profile_interval': 0, 05:02:24 INFO - 'suite': 'dromaeojs-e10s', 05:02:24 INFO - 'system_bits': '32', 05:02:24 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 05:02:24 INFO - 'title': 'talos-linux64-ix-009', 05:02:24 INFO - 'tooltool_cache': '/builds/tooltool_cache', 05:02:24 INFO - 'use_talos_json': True, 05:02:24 INFO - 'virtualenv_path': '/builds/slave/test-pgo/build/venv', 05:02:24 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 05:02:24 INFO - 'work_dir': 'build'} 05:02:24 INFO - ##### 05:02:24 INFO - ##### Running clobber step. 05:02:24 INFO - ##### 05:02:24 INFO - Running pre-action listener: _resource_record_pre_action 05:02:24 INFO - Running main action method: clobber 05:02:24 INFO - rmtree: /builds/slave/test-pgo/build 05:02:24 INFO - retry: Calling rmtree with args: ('/builds/slave/test-pgo/build',), kwargs: {}, attempt #1 05:02:25 INFO - Running post-action listener: _resource_record_post_action 05:02:25 INFO - ##### 05:02:25 INFO - ##### Running read-buildbot-config step. 05:02:25 INFO - ##### 05:02:25 INFO - Running pre-action listener: _resource_record_pre_action 05:02:25 INFO - Running main action method: read_buildbot_config 05:02:25 INFO - Using buildbot properties: 05:02:25 INFO - { 05:02:25 INFO - "project": "", 05:02:25 INFO - "product": "firefox", 05:02:25 INFO - "script_repo_revision": "production", 05:02:25 INFO - "builddir": "fx-team_ubuntu64_hw_test-dromaeojs-e10s", 05:02:25 INFO - "repository": "", 05:02:25 INFO - "buildername": "Ubuntu HW 12.04 x64 fx-team pgo talos dromaeojs-e10s", 05:02:25 INFO - "buildid": "20160211023003", 05:02:25 INFO - "pgo_build": "True", 05:02:25 INFO - "basedir": "/builds/slave/test-pgo", 05:02:25 INFO - "buildnumber": 284, 05:02:25 INFO - "slavename": "talos-linux64-ix-009", 05:02:25 INFO - "master": "http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/", 05:02:25 INFO - "platform": "ubuntu64_hw", 05:02:25 INFO - "scheduler": "tests-fx-team-linux64-pgo-talos", 05:02:25 INFO - "branch": "fx-team", 05:02:25 INFO - "repo_path": "integration/fx-team", 05:02:25 INFO - "revision": "ed1086f28ad16013658981a24fbd154913632710", 05:02:25 INFO - "stage_platform": "linux64-pgo", 05:02:25 INFO - "builduid": "a33aefedd3df4cac875f4ba48a330e01", 05:02:25 INFO - "slavebuilddir": "test" 05:02:25 INFO - } 05:02:25 INFO - Found installer url https://queue.taskcluster.net/v1/task/ZeyrmPOISB-v8xwwirjieA/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2. 05:02:25 INFO - Running post-action listener: _resource_record_post_action 05:02:25 INFO - ##### 05:02:25 INFO - ##### Running download-and-extract step. 05:02:25 INFO - ##### 05:02:25 INFO - Running pre-action listener: _resource_record_pre_action 05:02:25 INFO - Running main action method: download_and_extract 05:02:25 INFO - mkdir: /builds/slave/test-pgo/build/tests 05:02:25 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 05:02:25 INFO - https://queue.taskcluster.net/v1/task/ZeyrmPOISB-v8xwwirjieA/artifacts/public/build/test_packages.json matches https://queue.taskcluster.net 05:02:25 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ZeyrmPOISB-v8xwwirjieA/artifacts/public/build/test_packages.json 05:02:25 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ZeyrmPOISB-v8xwwirjieA/artifacts/public/build/test_packages.json 05:02:25 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ZeyrmPOISB-v8xwwirjieA/artifacts/public/build/test_packages.json to /builds/slave/test-pgo/build/test_packages.json 05:02:25 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ZeyrmPOISB-v8xwwirjieA/artifacts/public/build/test_packages.json', 'file_name': '/builds/slave/test-pgo/build/test_packages.json'}, attempt #1 05:02:29 INFO - Downloaded 1448 bytes. 05:02:29 INFO - Reading from file /builds/slave/test-pgo/build/test_packages.json 05:02:29 INFO - Using the following test package requirements: 05:02:29 INFO - {u'common': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip'], 05:02:29 INFO - u'cppunittest': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 05:02:29 INFO - u'firefox-47.0a1.en-US.linux-x86_64.cppunittest.tests.zip'], 05:02:29 INFO - u'gtest': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 05:02:29 INFO - u'firefox-47.0a1.en-US.linux-x86_64.gtest.tests.zip'], 05:02:29 INFO - u'jittest': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 05:02:29 INFO - u'jsshell-linux-x86_64.zip'], 05:02:29 INFO - u'mochitest': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 05:02:29 INFO - u'firefox-47.0a1.en-US.linux-x86_64.mochitest.tests.zip'], 05:02:29 INFO - u'mozbase': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip'], 05:02:29 INFO - u'reftest': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 05:02:29 INFO - u'firefox-47.0a1.en-US.linux-x86_64.reftest.tests.zip'], 05:02:29 INFO - u'talos': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 05:02:29 INFO - u'firefox-47.0a1.en-US.linux-x86_64.talos.tests.zip'], 05:02:29 INFO - u'web-platform': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 05:02:29 INFO - u'firefox-47.0a1.en-US.linux-x86_64.web-platform.tests.zip'], 05:02:29 INFO - u'webapprt': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip'], 05:02:29 INFO - u'xpcshell': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 05:02:29 INFO - u'firefox-47.0a1.en-US.linux-x86_64.xpcshell.tests.zip']} 05:02:29 INFO - Downloading packages: [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 05:02:29 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 05:02:29 INFO - https://queue.taskcluster.net/v1/task/ZeyrmPOISB-v8xwwirjieA/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 05:02:29 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ZeyrmPOISB-v8xwwirjieA/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip 05:02:29 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ZeyrmPOISB-v8xwwirjieA/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip 05:02:29 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ZeyrmPOISB-v8xwwirjieA/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip 05:02:29 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ZeyrmPOISB-v8xwwirjieA/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 05:02:36 INFO - Downloaded 23293514 bytes. 05:02:36 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test-pgo/build/tests'] 05:02:36 INFO - Copy/paste: unzip -q -o /builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test-pgo/build/tests 05:02:37 INFO - Return code: 0 05:02:37 INFO - Downloading packages: [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', u'firefox-47.0a1.en-US.linux-x86_64.talos.tests.zip'] for test suite category: talos 05:02:37 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 05:02:37 INFO - https://queue.taskcluster.net/v1/task/ZeyrmPOISB-v8xwwirjieA/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 05:02:37 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ZeyrmPOISB-v8xwwirjieA/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip 05:02:37 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ZeyrmPOISB-v8xwwirjieA/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip 05:02:37 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ZeyrmPOISB-v8xwwirjieA/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip 05:02:37 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ZeyrmPOISB-v8xwwirjieA/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 05:02:45 INFO - Downloaded 23293514 bytes. 05:02:45 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test-pgo/build/tests'] 05:02:45 INFO - Copy/paste: unzip -q -o /builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test-pgo/build/tests 05:02:46 INFO - Return code: 0 05:02:46 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 05:02:46 INFO - https://queue.taskcluster.net/v1/task/ZeyrmPOISB-v8xwwirjieA/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.talos.tests.zip matches https://queue.taskcluster.net 05:02:46 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ZeyrmPOISB-v8xwwirjieA/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.talos.tests.zip 05:02:46 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ZeyrmPOISB-v8xwwirjieA/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.talos.tests.zip 05:02:46 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ZeyrmPOISB-v8xwwirjieA/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.talos.tests.zip to /builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.talos.tests.zip 05:02:46 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ZeyrmPOISB-v8xwwirjieA/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.talos.tests.zip', 'file_name': u'/builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.talos.tests.zip'}, attempt #1 05:02:47 INFO - Downloaded 10706547 bytes. 05:02:47 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.talos.tests.zip', '-d', '/builds/slave/test-pgo/build/tests'] 05:02:47 INFO - Copy/paste: unzip -q -o /builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.talos.tests.zip -d /builds/slave/test-pgo/build/tests 05:02:48 INFO - Return code: 0 05:02:48 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 05:02:48 INFO - https://queue.taskcluster.net/v1/task/ZeyrmPOISB-v8xwwirjieA/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2 matches https://queue.taskcluster.net 05:02:48 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ZeyrmPOISB-v8xwwirjieA/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2 05:02:48 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ZeyrmPOISB-v8xwwirjieA/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2 05:02:48 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ZeyrmPOISB-v8xwwirjieA/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2 to /builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2 05:02:48 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ZeyrmPOISB-v8xwwirjieA/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2', 'file_name': '/builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2'}, attempt #1 05:02:50 INFO - Downloaded 56470696 bytes. 05:02:50 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/ZeyrmPOISB-v8xwwirjieA/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2 05:02:50 INFO - mkdir: /builds/slave/test-pgo/properties 05:02:50 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test-pgo/properties/build_url 05:02:50 INFO - Writing to file /builds/slave/test-pgo/properties/build_url 05:02:50 INFO - Contents: 05:02:50 INFO - build_url:https://queue.taskcluster.net/v1/task/ZeyrmPOISB-v8xwwirjieA/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2 05:02:51 INFO - Running post-action listener: _resource_record_post_action 05:02:51 INFO - Running post-action listener: set_extra_try_arguments 05:02:51 INFO - ##### 05:02:51 INFO - ##### Running populate-webroot step. 05:02:51 INFO - ##### 05:02:51 INFO - Running pre-action listener: _resource_record_pre_action 05:02:51 INFO - Running main action method: populate_webroot 05:02:51 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 05:02:51 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 05:02:51 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 05:02:51 INFO - '--tppagecycles', 05:02:51 INFO - '7'], 05:02:51 INFO - 'tests': ['tsvgm']}}, 05:02:51 INFO - 'suites': {'chromez': {'tests': ['tresize', 'tcanvasmark']}, 05:02:51 INFO - 'chromez-e10s': {'talos_options': ['--e10s'], 05:02:51 INFO - 'tests': ['tresize', 'tcanvasmark']}, 05:02:51 INFO - 'dromaeojs': {'tests': ['dromaeo_css', 'kraken']}, 05:02:51 INFO - 'dromaeojs-e10s': {'talos_options': ['--e10s'], 05:02:51 INFO - 'tests': ['dromaeo_css', 'kraken']}, 05:02:51 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 05:02:51 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 05:02:51 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 05:02:51 INFO - 'talos_options': ['--e10s'], 05:02:51 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 05:02:51 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 05:02:51 INFO - 'tests': ['damp', 'tps']}, 05:02:51 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 05:02:51 INFO - 'talos_options': ['--e10s'], 05:02:51 INFO - 'tests': ['damp', 'tps']}, 05:02:51 INFO - 'g3': {'tests': ['dromaeo_dom']}, 05:02:51 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 05:02:51 INFO - 'other': {'tests': ['a11yr', 05:02:51 INFO - 'ts_paint', 05:02:51 INFO - 'tpaint', 05:02:51 INFO - 'sessionrestore', 05:02:51 INFO - 'sessionrestore_no_auto_restore']}, 05:02:51 INFO - 'other-e10s': {'talos_options': ['--e10s'], 05:02:51 INFO - 'tests': ['a11yr', 05:02:51 INFO - 'ts_paint', 05:02:51 INFO - 'tpaint', 05:02:51 INFO - 'sessionrestore', 05:02:51 INFO - 'sessionrestore_no_auto_restore']}, 05:02:51 INFO - 'other-e10s_l64': {'talos_options': ['--e10s'], 05:02:51 INFO - 'tests': ['a11yr', 05:02:51 INFO - 'ts_paint', 05:02:51 INFO - 'tpaint', 05:02:51 INFO - 'sessionrestore', 05:02:51 INFO - 'sessionrestore_no_auto_restore']}, 05:02:51 INFO - 'other-e10s_nol64': {'talos_options': ['--e10s'], 05:02:51 INFO - 'tests': ['a11yr', 05:02:51 INFO - 'ts_paint', 05:02:51 INFO - 'tpaint', 05:02:51 INFO - 'sessionrestore', 05:02:51 INFO - 'sessionrestore_no_auto_restore']}, 05:02:51 INFO - 'other_l64': {'tests': ['a11yr', 05:02:51 INFO - 'ts_paint', 05:02:51 INFO - 'tpaint', 05:02:51 INFO - 'sessionrestore', 05:02:51 INFO - 'sessionrestore_no_auto_restore']}, 05:02:51 INFO - 'other_nol64': {'tests': ['a11yr', 05:02:51 INFO - 'ts_paint', 05:02:51 INFO - 'tpaint', 05:02:51 INFO - 'sessionrestore', 05:02:51 INFO - 'sessionrestore_no_auto_restore']}, 05:02:51 INFO - 'svgr': {'tests': ['tsvgx', 05:02:51 INFO - 'tsvgr_opacity', 05:02:51 INFO - 'tart', 05:02:51 INFO - 'tscrollx', 05:02:51 INFO - 'cart']}, 05:02:51 INFO - 'svgr-e10s': {'talos_options': ['--e10s'], 05:02:51 INFO - 'tests': ['tsvgx', 05:02:51 INFO - 'tsvgr_opacity', 05:02:51 INFO - 'tart', 05:02:51 INFO - 'tscrollx', 05:02:51 INFO - 'cart']}, 05:02:51 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 05:02:51 INFO - 'tests': ['tp5o']}, 05:02:51 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 05:02:51 INFO - 'talos_options': ['--e10s'], 05:02:51 INFO - 'tests': ['tp5o']}, 05:02:51 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 05:02:51 INFO - 'talos_options': ['--xperf_path', 05:02:51 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 05:02:51 INFO - 'tests': ['tp5n']}, 05:02:51 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 05:02:51 INFO - 'talos_options': ['--e10s', 05:02:51 INFO - '--xperf_path', 05:02:51 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 05:02:51 INFO - 'tests': ['tp5n']}}, 05:02:51 INFO - 'talos.zip': {'path': '', 05:02:51 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 05:02:51 INFO - Running post-action listener: _resource_record_post_action 05:02:51 INFO - ##### 05:02:51 INFO - ##### Running create-virtualenv step. 05:02:51 INFO - ##### 05:02:51 INFO - Running pre-action listener: _resource_record_pre_action 05:02:51 INFO - Running main action method: create_virtualenv 05:02:51 INFO - Creating virtualenv /builds/slave/test-pgo/build/venv 05:02:51 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 05:02:51 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test-pgo/build/venv 05:02:51 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 05:02:51 INFO - Using real prefix '/usr' 05:02:51 INFO - New python executable in /builds/slave/test-pgo/build/venv/bin/python 05:02:51 INFO - Installing distribute.............................................................................................................................................................................................done. 05:02:53 INFO - Installing pip.................done. 05:02:53 INFO - Return code: 0 05:02:53 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test-pgo/build/venv 05:02:53 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 05:02:53 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:02:53 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:02:53 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 05:02:53 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:02:53 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:02: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 0x7f8316f2af10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x19348a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1a01670>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1a908c0>, '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 0x1a917c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1a91c50>, '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': 'aa52b8aba932b19cc50b5275000001de-1455194244.947672-544072490', '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 05:02: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 05:02: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 05:02:53 INFO - Using env: {'DISPLAY': ':0', 05:02:53 INFO - 'HOME': '/home/cltbld', 05:02:53 INFO - 'LANG': 'en_US.UTF-8', 05:02:53 INFO - 'LANGUAGE': 'en_US:en', 05:02:53 INFO - 'LOGNAME': 'cltbld', 05:02:53 INFO - 'MAIL': '/var/mail/cltbld', 05:02:53 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:02:53 INFO - 'MOZ_NO_REMOTE': '1', 05:02:53 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:02:53 INFO - 'NO_EM_RESTART': '1', 05:02:53 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:02:53 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 05:02:53 INFO - 'PWD': '/builds/slave/test-pgo', 05:02:53 INFO - 'SHELL': '/bin/bash', 05:02:53 INFO - 'SHLVL': '1', 05:02:53 INFO - 'TERM': 'linux', 05:02:53 INFO - 'TMOUT': '86400', 05:02:53 INFO - 'USER': 'cltbld', 05:02:53 INFO - 'XDG_SESSION_COOKIE': 'aa52b8aba932b19cc50b5275000001de-1455194244.947672-544072490', 05:02:53 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:02:53 INFO - '_': '/tools/buildbot/bin/python'} 05:02:53 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:02: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 05:02:53 INFO - Cleaning up... 05:02:53 INFO - Return code: 0 05:02:53 INFO - Installing psutil>=0.7.1 into virtualenv /builds/slave/test-pgo/build/venv 05:02:53 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 05:02:53 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:02:53 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:02:53 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 05:02:53 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:02:53 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:02: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 0x7f8316f2af10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x19348a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1a01670>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1a908c0>, '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 0x1a917c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1a91c50>, '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': 'aa52b8aba932b19cc50b5275000001de-1455194244.947672-544072490', '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 05:02: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 05:02: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 05:02:53 INFO - Using env: {'DISPLAY': ':0', 05:02:53 INFO - 'HOME': '/home/cltbld', 05:02:53 INFO - 'LANG': 'en_US.UTF-8', 05:02:53 INFO - 'LANGUAGE': 'en_US:en', 05:02:53 INFO - 'LOGNAME': 'cltbld', 05:02:53 INFO - 'MAIL': '/var/mail/cltbld', 05:02:53 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:02:53 INFO - 'MOZ_NO_REMOTE': '1', 05:02:53 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:02:53 INFO - 'NO_EM_RESTART': '1', 05:02:53 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:02:53 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 05:02:53 INFO - 'PWD': '/builds/slave/test-pgo', 05:02:53 INFO - 'SHELL': '/bin/bash', 05:02:53 INFO - 'SHLVL': '1', 05:02:53 INFO - 'TERM': 'linux', 05:02:53 INFO - 'TMOUT': '86400', 05:02:53 INFO - 'USER': 'cltbld', 05:02:53 INFO - 'XDG_SESSION_COOKIE': 'aa52b8aba932b19cc50b5275000001de-1455194244.947672-544072490', 05:02:53 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:02:53 INFO - '_': '/tools/buildbot/bin/python'} 05:02:54 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:02:54 INFO - Downloading/unpacking psutil>=0.7.1 05:02:54 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 05:02:54 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 05:02:54 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 05:02:54 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 05:02:54 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 05:02:54 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 05:02:55 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/psutil/setup.py) egg_info for package psutil 05:02:55 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 05:02:55 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 05:02:55 INFO - Installing collected packages: psutil 05:02:55 INFO - Running setup.py install for psutil 05:02:56 INFO - building 'psutil._psutil_linux' extension 05:02:56 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 05:02:56 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 05:02:56 INFO - building 'psutil._psutil_posix' extension 05:02:56 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 05:02:56 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 05:02:56 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 05:02:56 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 05:02:56 INFO - Successfully installed psutil 05:02:56 INFO - Cleaning up... 05:02:56 INFO - Return code: 0 05:02:56 INFO - Installing mozsystemmonitor==0.0.0 into virtualenv /builds/slave/test-pgo/build/venv 05:02: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')]} 05:02:56 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:02:56 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:02: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')]} 05:02:56 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:02:56 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:02: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 0x7f8316f2af10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x19348a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1a01670>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1a908c0>, '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 0x1a917c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1a91c50>, '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': 'aa52b8aba932b19cc50b5275000001de-1455194244.947672-544072490', '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 05:02: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 05:02: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 05:02:56 INFO - Using env: {'DISPLAY': ':0', 05:02:56 INFO - 'HOME': '/home/cltbld', 05:02:56 INFO - 'LANG': 'en_US.UTF-8', 05:02:56 INFO - 'LANGUAGE': 'en_US:en', 05:02:56 INFO - 'LOGNAME': 'cltbld', 05:02:56 INFO - 'MAIL': '/var/mail/cltbld', 05:02:56 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:02:56 INFO - 'MOZ_NO_REMOTE': '1', 05:02:56 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:02:56 INFO - 'NO_EM_RESTART': '1', 05:02:56 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:02:56 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 05:02:56 INFO - 'PWD': '/builds/slave/test-pgo', 05:02:56 INFO - 'SHELL': '/bin/bash', 05:02:56 INFO - 'SHLVL': '1', 05:02:56 INFO - 'TERM': 'linux', 05:02:56 INFO - 'TMOUT': '86400', 05:02:56 INFO - 'USER': 'cltbld', 05:02:56 INFO - 'XDG_SESSION_COOKIE': 'aa52b8aba932b19cc50b5275000001de-1455194244.947672-544072490', 05:02:56 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:02:56 INFO - '_': '/tools/buildbot/bin/python'} 05:02:56 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:02:56 INFO - Downloading/unpacking mozsystemmonitor==0.0.0 05:02: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 05:02: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 05:02: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 05:02: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 05:02: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 05:02: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 05:02:58 INFO - Downloading mozsystemmonitor-0.0.tar.gz 05:02:58 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 05:02: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) 05:02:58 INFO - Installing collected packages: mozsystemmonitor 05:02:58 INFO - Running setup.py install for mozsystemmonitor 05:02:58 INFO - Successfully installed mozsystemmonitor 05:02:58 INFO - Cleaning up... 05:02:58 INFO - Return code: 0 05:02:58 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test-pgo/build/venv 05:02:58 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 05:02:58 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:02:58 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:02:58 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 05:02:58 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:02:58 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:02: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 0x7f8316f2af10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x19348a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1a01670>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1a908c0>, '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 0x1a917c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1a91c50>, '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': 'aa52b8aba932b19cc50b5275000001de-1455194244.947672-544072490', '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 05:02: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 05:02: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 05:02:58 INFO - Using env: {'DISPLAY': ':0', 05:02:58 INFO - 'HOME': '/home/cltbld', 05:02:58 INFO - 'LANG': 'en_US.UTF-8', 05:02:58 INFO - 'LANGUAGE': 'en_US:en', 05:02:58 INFO - 'LOGNAME': 'cltbld', 05:02:58 INFO - 'MAIL': '/var/mail/cltbld', 05:02:58 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:02:58 INFO - 'MOZ_NO_REMOTE': '1', 05:02:58 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:02:58 INFO - 'NO_EM_RESTART': '1', 05:02:58 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:02:58 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 05:02:58 INFO - 'PWD': '/builds/slave/test-pgo', 05:02:58 INFO - 'SHELL': '/bin/bash', 05:02:58 INFO - 'SHLVL': '1', 05:02:58 INFO - 'TERM': 'linux', 05:02:58 INFO - 'TMOUT': '86400', 05:02:58 INFO - 'USER': 'cltbld', 05:02:58 INFO - 'XDG_SESSION_COOKIE': 'aa52b8aba932b19cc50b5275000001de-1455194244.947672-544072490', 05:02:58 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:02:58 INFO - '_': '/tools/buildbot/bin/python'} 05:02:58 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:02:58 INFO - Downloading/unpacking blobuploader==1.2.4 05:02: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 05:02: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 05:02: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 05:02: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 05:02: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 05:02: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 05:03:00 INFO - Downloading blobuploader-1.2.4.tar.gz 05:03:00 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 05:03:00 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 05:03: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 05:03: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 05:03: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 05:03: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 05:03: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 05:03: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 05:03:00 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/requests/setup.py) egg_info for package requests 05:03:01 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 05:03:01 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:03:01 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:03:01 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 05:03:01 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 05:03:01 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:03:01 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:03:01 INFO - Downloading docopt-0.6.1.tar.gz 05:03:01 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/docopt/setup.py) egg_info for package docopt 05:03:01 INFO - Installing collected packages: blobuploader, requests, docopt 05:03:01 INFO - Running setup.py install for blobuploader 05:03:01 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 05:03:01 INFO - changing mode of /builds/slave/test-pgo/build/venv/bin/blobberc.py to 775 05:03:01 INFO - Running setup.py install for requests 05:03:01 INFO - Running setup.py install for docopt 05:03:01 INFO - Successfully installed blobuploader requests docopt 05:03:01 INFO - Cleaning up... 05:03:01 INFO - Return code: 0 05:03:01 INFO - Installing None into virtualenv /builds/slave/test-pgo/build/venv 05:03: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')]} 05:03:01 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:03:01 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:03: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')]} 05:03:01 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:03:01 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:03: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 0x7f8316f2af10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x19348a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1a01670>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1a908c0>, '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 0x1a917c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1a91c50>, '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': 'aa52b8aba932b19cc50b5275000001de-1455194244.947672-544072490', '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 05:03: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 05:03: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 05:03:02 INFO - Using env: {'DISPLAY': ':0', 05:03:02 INFO - 'HOME': '/home/cltbld', 05:03:02 INFO - 'LANG': 'en_US.UTF-8', 05:03:02 INFO - 'LANGUAGE': 'en_US:en', 05:03:02 INFO - 'LOGNAME': 'cltbld', 05:03:02 INFO - 'MAIL': '/var/mail/cltbld', 05:03:02 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:03:02 INFO - 'MOZ_NO_REMOTE': '1', 05:03:02 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:03:02 INFO - 'NO_EM_RESTART': '1', 05:03:02 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:03:02 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 05:03:02 INFO - 'PWD': '/builds/slave/test-pgo', 05:03:02 INFO - 'SHELL': '/bin/bash', 05:03:02 INFO - 'SHLVL': '1', 05:03:02 INFO - 'TERM': 'linux', 05:03:02 INFO - 'TMOUT': '86400', 05:03:02 INFO - 'USER': 'cltbld', 05:03:02 INFO - 'XDG_SESSION_COOKIE': 'aa52b8aba932b19cc50b5275000001de-1455194244.947672-544072490', 05:03:02 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:03:02 INFO - '_': '/tools/buildbot/bin/python'} 05:03:02 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:03:02 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/manifestparser 05:03:02 INFO - Running setup.py (path:/tmp/pip-Yc76vN-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/manifestparser 05:03:02 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozcrash 05:03:02 INFO - Running setup.py (path:/tmp/pip-W5opTy-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozcrash 05:03:02 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdebug 05:03:02 INFO - Running setup.py (path:/tmp/pip-3G1SN7-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdebug 05:03:02 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdevice 05:03:02 INFO - Running setup.py (path:/tmp/pip-u0z5a2-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdevice 05:03:02 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozfile 05:03:02 INFO - Running setup.py (path:/tmp/pip-LOCBzJ-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozfile 05:03:02 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozhttpd 05:03:02 INFO - Running setup.py (path:/tmp/pip-qiZhuE-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozhttpd 05:03:02 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinfo 05:03:02 INFO - Running setup.py (path:/tmp/pip-u5dViH-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinfo 05:03:02 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinstall 05:03:02 INFO - Running setup.py (path:/tmp/pip-e1b0Ab-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinstall 05:03:02 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozleak 05:03:02 INFO - Running setup.py (path:/tmp/pip-uPYmhb-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozleak 05:03:02 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozlog 05:03:02 INFO - Running setup.py (path:/tmp/pip-jg3hXq-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozlog 05:03:02 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moznetwork 05:03:02 INFO - Running setup.py (path:/tmp/pip-CSEDeC-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moznetwork 05:03:02 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprocess 05:03:02 INFO - Running setup.py (path:/tmp/pip-6kx0aS-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprocess 05:03:03 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprofile 05:03:03 INFO - Running setup.py (path:/tmp/pip-NDj7Uv-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprofile 05:03:03 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozrunner 05:03:03 INFO - Running setup.py (path:/tmp/pip-NnxLuv-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozrunner 05:03:03 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 05:03:03 INFO - Running setup.py (path:/tmp/pip-_3Xzwr-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 05:03:03 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moztest 05:03:03 INFO - Running setup.py (path:/tmp/pip-TMxfR1-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moztest 05:03:03 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozversion 05:03:03 INFO - Running setup.py (path:/tmp/pip-EPVlDt-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozversion 05:03:03 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 05:03:03 INFO - Running setup.py install for manifestparser 05:03:03 INFO - Installing manifestparser script to /builds/slave/test-pgo/build/venv/bin 05:03:03 INFO - Running setup.py install for mozcrash 05:03:03 INFO - Running setup.py install for mozdebug 05:03:03 INFO - Running setup.py install for mozdevice 05:03:03 INFO - Installing sutini script to /builds/slave/test-pgo/build/venv/bin 05:03:03 INFO - Installing dm script to /builds/slave/test-pgo/build/venv/bin 05:03:03 INFO - Running setup.py install for mozfile 05:03:03 INFO - Running setup.py install for mozhttpd 05:03:04 INFO - Installing mozhttpd script to /builds/slave/test-pgo/build/venv/bin 05:03:04 INFO - Running setup.py install for mozinfo 05:03:04 INFO - Installing mozinfo script to /builds/slave/test-pgo/build/venv/bin 05:03:04 INFO - Running setup.py install for mozInstall 05:03:04 INFO - Installing moz_remove_from_system script to /builds/slave/test-pgo/build/venv/bin 05:03:04 INFO - Installing mozuninstall script to /builds/slave/test-pgo/build/venv/bin 05:03:04 INFO - Installing mozinstall script to /builds/slave/test-pgo/build/venv/bin 05:03:04 INFO - Installing moz_add_to_system script to /builds/slave/test-pgo/build/venv/bin 05:03:04 INFO - Running setup.py install for mozleak 05:03:04 INFO - Running setup.py install for mozlog 05:03:04 INFO - Installing structlog script to /builds/slave/test-pgo/build/venv/bin 05:03:04 INFO - Running setup.py install for moznetwork 05:03:04 INFO - Installing moznetwork script to /builds/slave/test-pgo/build/venv/bin 05:03:04 INFO - Running setup.py install for mozprocess 05:03:04 INFO - Running setup.py install for mozprofile 05:03:04 INFO - Installing mozprofile script to /builds/slave/test-pgo/build/venv/bin 05:03:04 INFO - Installing diff-profiles script to /builds/slave/test-pgo/build/venv/bin 05:03:04 INFO - Installing view-profile script to /builds/slave/test-pgo/build/venv/bin 05:03:04 INFO - Running setup.py install for mozrunner 05:03:04 INFO - Installing mozrunner script to /builds/slave/test-pgo/build/venv/bin 05:03:04 INFO - Running setup.py install for mozscreenshot 05:03:04 INFO - Running setup.py install for moztest 05:03:05 INFO - Running setup.py install for mozversion 05:03:05 INFO - Installing mozversion script to /builds/slave/test-pgo/build/venv/bin 05:03:05 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 05:03:05 INFO - Cleaning up... 05:03:05 INFO - Return code: 0 05:03:05 INFO - Installing None into virtualenv /builds/slave/test-pgo/build/venv 05:03:05 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 05:03:05 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:03:05 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:03:05 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 05:03:05 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:03:05 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:03:05 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 0x7f8316f2af10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x19348a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1a01670>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1a908c0>, '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 0x1a917c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1a91c50>, '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': 'aa52b8aba932b19cc50b5275000001de-1455194244.947672-544072490', '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 05:03:05 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 05:03:05 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 05:03:05 INFO - Using env: {'DISPLAY': ':0', 05:03:05 INFO - 'HOME': '/home/cltbld', 05:03:05 INFO - 'LANG': 'en_US.UTF-8', 05:03:05 INFO - 'LANGUAGE': 'en_US:en', 05:03:05 INFO - 'LOGNAME': 'cltbld', 05:03:05 INFO - 'MAIL': '/var/mail/cltbld', 05:03:05 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:03:05 INFO - 'MOZ_NO_REMOTE': '1', 05:03:05 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:03:05 INFO - 'NO_EM_RESTART': '1', 05:03:05 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:03:05 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 05:03:05 INFO - 'PWD': '/builds/slave/test-pgo', 05:03:05 INFO - 'SHELL': '/bin/bash', 05:03:05 INFO - 'SHLVL': '1', 05:03:05 INFO - 'TERM': 'linux', 05:03:05 INFO - 'TMOUT': '86400', 05:03:05 INFO - 'USER': 'cltbld', 05:03:05 INFO - 'XDG_SESSION_COOKIE': 'aa52b8aba932b19cc50b5275000001de-1455194244.947672-544072490', 05:03:05 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:03:05 INFO - '_': '/tools/buildbot/bin/python'} 05:03:05 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:03:05 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/manifestparser 05:03:05 INFO - Running setup.py (path:/tmp/pip-Uhy3Z1-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/manifestparser 05:03: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)) 05:03:05 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozcrash 05:03:05 INFO - Running setup.py (path:/tmp/pip-NoxFVI-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozcrash 05:03:05 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash==0.16 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)) 05:03:05 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdebug 05:03:05 INFO - Running setup.py (path:/tmp/pip-oWwHWV-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdebug 05:03: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)) 05:03:05 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdevice 05:03:05 INFO - Running setup.py (path:/tmp/pip-mFVKoa-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdevice 05:03: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)) 05:03:05 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozfile 05:03:05 INFO - Running setup.py (path:/tmp/pip-EmGUJ4-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozfile 05:03: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)) 05:03:05 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozhttpd 05:03:05 INFO - Running setup.py (path:/tmp/pip-mLfdMW-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozhttpd 05:03: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)) 05:03:05 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinfo 05:03:05 INFO - Running setup.py (path:/tmp/pip-cbyQMj-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinfo 05:03: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)) 05:03:05 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinstall 05:03:05 INFO - Running setup.py (path:/tmp/pip-aWyNb9-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinstall 05:03: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)) 05:03:05 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozleak 05:03:06 INFO - Running setup.py (path:/tmp/pip-Gl8Q1P-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozleak 05:03:06 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)) 05:03:06 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozlog 05:03:06 INFO - Running setup.py (path:/tmp/pip-GeMbWp-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozlog 05:03:06 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)) 05:03:06 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moznetwork 05:03:06 INFO - Running setup.py (path:/tmp/pip-RAcpzW-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moznetwork 05:03: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)) 05:03:06 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprocess 05:03:06 INFO - Running setup.py (path:/tmp/pip-Z54B8s-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprocess 05:03: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)) 05:03:06 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprofile 05:03:06 INFO - Running setup.py (path:/tmp/pip-BNDJrn-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprofile 05:03: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)) 05:03:06 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozrunner 05:03:06 INFO - Running setup.py (path:/tmp/pip-Z8nAVO-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozrunner 05:03: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)) 05:03:06 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 05:03:06 INFO - Running setup.py (path:/tmp/pip-S3Gyr7-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 05:03: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)) 05:03:06 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moztest 05:03:06 INFO - Running setup.py (path:/tmp/pip-goQpsr-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moztest 05:03: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)) 05:03:06 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozversion 05:03:06 INFO - Running setup.py (path:/tmp/pip-CWzvfu-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozversion 05:03: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)) 05:03: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.16->-r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 2)) 05:03: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.16->-r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 2)) 05:03: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)) 05:03: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)) 05:03: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)) 05:03:06 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.1->-r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 10)) 05:03: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 05:03: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 05:03: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 05:03: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 05:03: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 05:03: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 05:03:08 INFO - Downloading blessings-1.6.tar.gz 05:03:08 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/blessings/setup.py) egg_info for package blessings 05:03:08 INFO - Installing collected packages: blessings 05:03:08 INFO - Running setup.py install for blessings 05:03:08 INFO - Successfully installed blessings 05:03:08 INFO - Cleaning up... 05:03:08 INFO - Return code: 0 05:03:08 INFO - Done creating virtualenv /builds/slave/test-pgo/build/venv. 05:03:08 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'freeze'] 05:03:08 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip freeze 05:03:08 INFO - Reading from file tmpfile_stdout 05:03:08 INFO - Current package versions: 05:03:08 INFO - argparse == 1.2.1 05:03:08 INFO - blessings == 1.6 05:03:08 INFO - blobuploader == 1.2.4 05:03:08 INFO - docopt == 0.6.1 05:03:08 INFO - manifestparser == 1.1 05:03:08 INFO - mozInstall == 1.12 05:03:08 INFO - mozcrash == 0.16 05:03:08 INFO - mozdebug == 0.1 05:03:08 INFO - mozdevice == 0.48 05:03:08 INFO - mozfile == 1.2 05:03:08 INFO - mozhttpd == 0.7 05:03:08 INFO - mozinfo == 0.9 05:03:08 INFO - mozleak == 0.1 05:03:08 INFO - mozlog == 3.1 05:03:08 INFO - moznetwork == 0.27 05:03:08 INFO - mozprocess == 0.22 05:03:08 INFO - mozprofile == 0.28 05:03:08 INFO - mozrunner == 6.11 05:03:08 INFO - mozscreenshot == 0.1 05:03:08 INFO - mozsystemmonitor == 0.0 05:03:08 INFO - moztest == 0.7 05:03:08 INFO - mozversion == 1.4 05:03:08 INFO - psutil == 3.1.1 05:03:08 INFO - requests == 1.2.3 05:03:08 INFO - wsgiref == 0.1.2 05:03:08 INFO - Installing None into virtualenv /builds/slave/test-pgo/build/venv 05:03: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')]} 05:03:08 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:03:08 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:03: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')]} 05:03:08 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:03:08 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:03: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 0x7f8316f2af10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x19348a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1a01670>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1a908c0>, '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 0x1a917c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1a91c50>, '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': 'aa52b8aba932b19cc50b5275000001de-1455194244.947672-544072490', '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 05:03: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 05:03: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 05:03:08 INFO - Using env: {'DISPLAY': ':0', 05:03:08 INFO - 'HOME': '/home/cltbld', 05:03:08 INFO - 'LANG': 'en_US.UTF-8', 05:03:08 INFO - 'LANGUAGE': 'en_US:en', 05:03:08 INFO - 'LOGNAME': 'cltbld', 05:03:08 INFO - 'MAIL': '/var/mail/cltbld', 05:03:08 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:03:08 INFO - 'MOZ_NO_REMOTE': '1', 05:03:08 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:03:08 INFO - 'NO_EM_RESTART': '1', 05:03:08 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:03:08 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 05:03:08 INFO - 'PWD': '/builds/slave/test-pgo', 05:03:08 INFO - 'SHELL': '/bin/bash', 05:03:08 INFO - 'SHLVL': '1', 05:03:08 INFO - 'TERM': 'linux', 05:03:08 INFO - 'TMOUT': '86400', 05:03:08 INFO - 'USER': 'cltbld', 05:03:08 INFO - 'XDG_SESSION_COOKIE': 'aa52b8aba932b19cc50b5275000001de-1455194244.947672-544072490', 05:03:08 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:03:08 INFO - '_': '/tools/buildbot/bin/python'} 05:03:09 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:03:09 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)) 05:03:09 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)) 05:03:09 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)) 05:03:09 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)) 05:03:09 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)) 05:03:09 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)) 05:03:09 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)) 05:03:09 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)) 05:03:09 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)) 05:03:09 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)) 05:03:09 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)) 05:03:09 INFO - Cleaning up... 05:03:09 INFO - Return code: 0 05:03:09 INFO - Installing jsonschema into virtualenv /builds/slave/test-pgo/build/venv 05:03:09 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 05:03:09 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:03:09 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:03:09 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 05:03:09 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:03:09 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:03:09 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 0x7f8316f2af10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x19348a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1a01670>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1a908c0>, '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 0x1a917c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1a91c50>, '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': 'aa52b8aba932b19cc50b5275000001de-1455194244.947672-544072490', '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 05:03:09 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 05:03:09 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 05:03:09 INFO - Using env: {'DISPLAY': ':0', 05:03:09 INFO - 'HOME': '/home/cltbld', 05:03:09 INFO - 'LANG': 'en_US.UTF-8', 05:03:09 INFO - 'LANGUAGE': 'en_US:en', 05:03:09 INFO - 'LOGNAME': 'cltbld', 05:03:09 INFO - 'MAIL': '/var/mail/cltbld', 05:03:09 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:03:09 INFO - 'MOZ_NO_REMOTE': '1', 05:03:09 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:03:09 INFO - 'NO_EM_RESTART': '1', 05:03:09 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:03:09 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 05:03:09 INFO - 'PWD': '/builds/slave/test-pgo', 05:03:09 INFO - 'SHELL': '/bin/bash', 05:03:09 INFO - 'SHLVL': '1', 05:03:09 INFO - 'TERM': 'linux', 05:03:09 INFO - 'TMOUT': '86400', 05:03:09 INFO - 'USER': 'cltbld', 05:03:09 INFO - 'XDG_SESSION_COOKIE': 'aa52b8aba932b19cc50b5275000001de-1455194244.947672-544072490', 05:03:09 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:03:09 INFO - '_': '/tools/buildbot/bin/python'} 05:03:09 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:03:09 INFO - Downloading/unpacking jsonschema 05:03: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 05:03: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 05:03: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 05:03: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 05:03: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 05:03: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 05:03:11 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 05:03:11 INFO - Downloading/unpacking functools32 (from jsonschema) 05:03: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 05:03: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 05:03: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 05:03: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 05:03: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 05:03: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 05:03:11 INFO - Downloading functools32-3.2.3-2.tar.gz 05:03:11 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/functools32/setup.py) egg_info for package functools32 05:03:11 INFO - warning: no files found matching '*.txt' 05:03:11 INFO - no previously-included directories found matching 'build' 05:03:11 INFO - no previously-included directories found matching 'dist' 05:03:11 INFO - no previously-included directories found matching '.git*' 05:03:11 INFO - Installing collected packages: jsonschema, functools32 05:03:11 INFO - Running setup.py install for functools32 05:03:11 INFO - warning: no files found matching '*.txt' 05:03:11 INFO - no previously-included directories found matching 'build' 05:03:11 INFO - no previously-included directories found matching 'dist' 05:03:11 INFO - no previously-included directories found matching '.git*' 05:03:11 INFO - Successfully installed jsonschema functools32 05:03:11 INFO - Cleaning up... 05:03:11 INFO - Return code: 0 05:03:11 INFO - Installing flake8 into virtualenv /builds/slave/test-pgo/build/venv 05:03: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')]} 05:03:11 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:03:11 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:03: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')]} 05:03:11 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:03:11 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:03: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 0x7f8316f2af10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x19348a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1a01670>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1a908c0>, '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 0x1a917c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1a91c50>, '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': 'aa52b8aba932b19cc50b5275000001de-1455194244.947672-544072490', '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 05:03: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 05:03: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 05:03:11 INFO - Using env: {'DISPLAY': ':0', 05:03:11 INFO - 'HOME': '/home/cltbld', 05:03:11 INFO - 'LANG': 'en_US.UTF-8', 05:03:11 INFO - 'LANGUAGE': 'en_US:en', 05:03:11 INFO - 'LOGNAME': 'cltbld', 05:03:11 INFO - 'MAIL': '/var/mail/cltbld', 05:03:11 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:03:11 INFO - 'MOZ_NO_REMOTE': '1', 05:03:11 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:03:11 INFO - 'NO_EM_RESTART': '1', 05:03:11 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:03:11 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 05:03:11 INFO - 'PWD': '/builds/slave/test-pgo', 05:03:11 INFO - 'SHELL': '/bin/bash', 05:03:11 INFO - 'SHLVL': '1', 05:03:11 INFO - 'TERM': 'linux', 05:03:11 INFO - 'TMOUT': '86400', 05:03:11 INFO - 'USER': 'cltbld', 05:03:11 INFO - 'XDG_SESSION_COOKIE': 'aa52b8aba932b19cc50b5275000001de-1455194244.947672-544072490', 05:03:11 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:03:11 INFO - '_': '/tools/buildbot/bin/python'} 05:03:11 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:03:11 INFO - Downloading/unpacking flake8 05:03: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 05:03: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 05:03: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 05:03: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 05:03: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 05:03: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 05:03:13 INFO - Downloading flake8-2.5.0-py2.py3-none-any.whl 05:03:13 INFO - Downloading/unpacking mccabe>=0.2.1,<0.4 (from flake8) 05:03: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 05:03: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 05:03: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 05:03: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 05:03: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 05:03: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 05:03:13 INFO - Downloading mccabe-0.3.1-py2.py3-none-any.whl 05:03:13 INFO - Downloading/unpacking pyflakes>=0.8.1,<1.1 (from flake8) 05:03: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 05:03: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 05:03: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 05:03: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 05:03: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 05:03: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 05:03:13 INFO - Downloading/unpacking pep8>=1.5.7,!=1.6.0,!=1.6.1,!=1.6.2 (from flake8) 05:03: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 05:03: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 05:03: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 05:03: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 05:03: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 05:03: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 05:03:14 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/pep8/setup.py) egg_info for package pep8 05:03:14 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 05:03:14 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 05:03:14 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 05:03:14 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 05:03:14 INFO - no previously-included directories found matching 'docs/_build' 05:03:14 INFO - Installing collected packages: flake8, mccabe, pyflakes, pep8 05:03:14 INFO - Running setup.py install for pep8 05:03:14 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 05:03:14 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 05:03:14 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 05:03:14 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 05:03:14 INFO - no previously-included directories found matching 'docs/_build' 05:03:14 INFO - Installing pep8 script to /builds/slave/test-pgo/build/venv/bin 05:03:14 INFO - Successfully installed flake8 mccabe pyflakes pep8 05:03:14 INFO - Cleaning up... 05:03:14 INFO - Return code: 0 05:03:14 INFO - Running post-action listener: _resource_record_post_action 05:03:14 INFO - Running post-action listener: _start_resource_monitoring 05:03:14 INFO - Starting resource monitoring. 05:03:14 INFO - ##### 05:03:14 INFO - ##### Running install step. 05:03:14 INFO - ##### 05:03:14 INFO - Running pre-action listener: _resource_record_pre_action 05:03:14 INFO - Running main action method: install 05:03:14 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'freeze'] 05:03:14 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip freeze 05:03:14 INFO - Reading from file tmpfile_stdout 05:03:14 INFO - Detecting whether we're running mozinstall >=1.0... 05:03:14 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/mozinstall', '-h'] 05:03:14 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/mozinstall -h 05:03:14 INFO - Reading from file tmpfile_stdout 05:03:14 INFO - Output received: 05:03:14 INFO - Usage: mozinstall [options] installer 05:03:14 INFO - Options: 05:03:14 INFO - -h, --help show this help message and exit 05:03:14 INFO - -d DEST, --destination=DEST 05:03:14 INFO - Directory to install application into. [default: 05:03:14 INFO - "/builds/slave/test-pgo"] 05:03:14 INFO - --app=APP Application being installed. [default: firefox] 05:03:14 INFO - mkdir: /builds/slave/test-pgo/build/application 05:03:14 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/mozinstall', '/builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2', '--destination', '/builds/slave/test-pgo/build/application'] 05:03:14 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/mozinstall /builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2 --destination /builds/slave/test-pgo/build/application 05:03:30 INFO - Reading from file tmpfile_stdout 05:03:30 INFO - Output received: 05:03:30 INFO - /builds/slave/test-pgo/build/application/firefox/firefox 05:03:30 INFO - Running post-action listener: _resource_record_post_action 05:03:30 INFO - ##### 05:03:30 INFO - ##### Running run-tests step. 05:03:30 INFO - ##### 05:03:30 INFO - Running pre-action listener: _resource_record_pre_action 05:03:30 INFO - Running main action method: run_tests 05:03:30 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/python', '--version'] 05:03:30 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/python --version 05:03:31 INFO - Python 2.7.3 05:03:31 INFO - Return code: 0 05:03:31 INFO - grabbing minidump binary from tooltool 05:03: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')]} 05:03: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 0x1a908c0>, '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 0x1a917c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1a91c50>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test-pgo/build', 'privileged': False}, attempt #1 05:03: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 05:03: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 05:03:31 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 05:03:31 INFO - Return code: 0 05:03:31 INFO - Chmoding /builds/slave/test-pgo/build/linux64-minidump_stackwalk to 0755 05:03:31 INFO - mkdir: /builds/slave/test-pgo/build/blobber_upload_dir 05:03:31 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test-pgo/build/blobber_upload_dir 05:03:31 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test-pgo/build/linux64-minidump_stackwalk 05:03:31 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test-pgo/build/blobber_upload_dir 05:03:31 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/flake8', '/builds/slave/test-pgo/build/tests/talos/talos'] 05:03:31 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/flake8 /builds/slave/test-pgo/build/tests/talos/talos 05:03:32 INFO - Return code: 0 05:03:32 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/python', '/builds/slave/test-pgo/build/tests/talos/talos/run_tests.py', '--branchName', 'Fx-Team', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test-pgo/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/ZeyrmPOISB-v8xwwirjieA/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-009', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log', '--log-raw=/builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs-e10s_raw.log'] in /builds/slave/test-pgo/build 05:03:32 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/python /builds/slave/test-pgo/build/tests/talos/talos/run_tests.py --branchName Fx-Team --suite dromaeojs-e10s --executablePath /builds/slave/test-pgo/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/ZeyrmPOISB-v8xwwirjieA/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-009 --webServer localhost --log-tbpl-level=debug --log-errorsummary=/builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log --log-raw=/builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs-e10s_raw.log 05:03:32 INFO - Using env: {'DISPLAY': ':0', 05:03:32 INFO - 'HOME': '/home/cltbld', 05:03:32 INFO - 'LANG': 'en_US.UTF-8', 05:03:32 INFO - 'LANGUAGE': 'en_US:en', 05:03:32 INFO - 'LOGNAME': 'cltbld', 05:03:32 INFO - 'MAIL': '/var/mail/cltbld', 05:03:32 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test-pgo/build/blobber_upload_dir', 05:03:32 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test-pgo/build/linux64-minidump_stackwalk', 05:03:32 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:03:32 INFO - 'MOZ_NO_REMOTE': '1', 05:03:32 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test-pgo/build/blobber_upload_dir', 05:03:32 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:03:32 INFO - 'NO_EM_RESTART': '1', 05:03:32 INFO - 'PATH': '/builds/slave/test-pgo/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:03:32 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 05:03:32 INFO - 'PWD': '/builds/slave/test-pgo', 05:03:32 INFO - 'PYTHONPATH': '/builds/slave/test-pgo/build/tests/talos', 05:03:32 INFO - 'SHELL': '/bin/bash', 05:03:32 INFO - 'SHLVL': '1', 05:03:32 INFO - 'TERM': 'linux', 05:03:32 INFO - 'TMOUT': '86400', 05:03:32 INFO - 'USER': 'cltbld', 05:03:32 INFO - 'XDG_SESSION_COOKIE': 'aa52b8aba932b19cc50b5275000001de-1455194244.947672-544072490', 05:03:32 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:03:32 INFO - '_': '/tools/buildbot/bin/python'} 05:03:32 INFO - Calling ['/builds/slave/test-pgo/build/venv/bin/python', '/builds/slave/test-pgo/build/tests/talos/talos/run_tests.py', '--branchName', 'Fx-Team', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test-pgo/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/ZeyrmPOISB-v8xwwirjieA/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-009', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log', '--log-raw=/builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs-e10s_raw.log'] with output_timeout 3600 05:03:32 INFO - mozversion application_buildid: 20160211023003 05:03:32 INFO - mozversion application_changeset: ed1086f28ad16013658981a24fbd154913632710 05:03:32 INFO - mozversion application_display_name: Nightly 05:03:32 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 05:03:32 INFO - mozversion application_name: Firefox 05:03:32 INFO - mozversion application_remotingname: firefox 05:03:32 INFO - mozversion application_repository: https://hg.mozilla.org/integration/fx-team 05:03:32 INFO - mozversion application_vendor: Mozilla 05:03:32 INFO - mozversion application_version: 47.0a1 05:03:32 INFO - mozversion platform_buildid: 20160211023003 05:03:32 INFO - mozversion platform_changeset: ed1086f28ad16013658981a24fbd154913632710 05:03:32 INFO - mozversion platform_repository: https://hg.mozilla.org/integration/fx-team 05:03:32 INFO - mozversion platform_version: 47.0a1 05:03:32 INFO - using testdate: 1455195812 05:03:32 INFO - actual date: 1455195812 05:03:32 INFO - starting webserver on 'localhost:33129' 05:03:32 INFO - SUITE-START | Running 2 tests 05:03:32 INFO - TEST-START | dromaeo_css 05:03:32 INFO - operating with platform_type : linux_ 05:03:32 INFO - Initialising browser for dromaeo_css test... 05:03:32 INFO - TEST-INFO | started process 10196 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmp3gMU_V/profile http://localhost:33129/getInfo.html) 05:03:36 INFO - PROCESS | 10196 | 05:03:36 INFO - PROCESS | 10196 | (process:10281): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 05:03:37 INFO - PROCESS | 10196 | __metrics Screen width/height:1600/1200 05:03:37 INFO - PROCESS | 10196 | colorDepth:24 05:03:37 INFO - PROCESS | 10196 | Browser inner width/height: 1024/697 05:03:37 INFO - PROCESS | 10196 | __metrics 05:03:38 INFO - TEST-INFO | 10196: exit 0 05:03:38 INFO - Browser initialized. 05:03:38 INFO - Running cycle 1/1 for dromaeo_css test... 05:03:38 INFO - TEST-INFO | started process 10330 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmp3gMU_V/profile -tp file:/builds/slave/test-pgo/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 05:03:40 INFO - PROCESS | 10330 | 05:03:40 INFO - PROCESS | 10330 | (process:10392): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 05:03:50 INFO - PROCESS | 10330 | RSS: Main: 156246016 05:03:50 INFO - PROCESS | 10330 | 05:04:40 INFO - PROCESS | 10330 | 1455195880154 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] 05:06:49 INFO - PROCESS | 10330 | Cycle 1(1): loaded http://localhost:33129/tests/dromaeo/cssquery-dojo.html (next: http://localhost:33129/tests/dromaeo/cssquery-ext.html) 05:06:50 INFO - PROCESS | 10330 | RSS: Main: 162680832 05:06:50 INFO - PROCESS | 10330 | 05:09:52 INFO - PROCESS | 10330 | Cycle 1(1): loaded http://localhost:33129/tests/dromaeo/cssquery-ext.html (next: http://localhost:33129/tests/dromaeo/cssquery-jquery.html) 05:09:53 INFO - PROCESS | 10330 | RSS: Main: 158965760 05:09:53 INFO - PROCESS | 10330 | 05:12:55 INFO - PROCESS | 10330 | Cycle 1(1): loaded http://localhost:33129/tests/dromaeo/cssquery-jquery.html (next: http://localhost:33129/tests/dromaeo/cssquery-mootools.html) 05:12:55 INFO - PROCESS | 10330 | RSS: Main: 159043584 05:12:55 INFO - PROCESS | 10330 | 05:15:57 INFO - PROCESS | 10330 | Cycle 1(1): loaded http://localhost:33129/tests/dromaeo/cssquery-mootools.html (next: http://localhost:33129/tests/dromaeo/cssquery-prototype.html) 05:15:57 INFO - PROCESS | 10330 | RSS: Main: 157470720 05:15:57 INFO - PROCESS | 10330 | 05:19:00 INFO - PROCESS | 10330 | Cycle 1(1): loaded http://localhost:33129/tests/dromaeo/cssquery-prototype.html (next: http://localhost:33129/tests/dromaeo/cssquery-yui.html) 05:19:01 INFO - PROCESS | 10330 | RSS: Main: 156557312 05:19:01 INFO - PROCESS | 10330 | 05:22:03 INFO - PROCESS | 10330 | Cycle 1(1): loaded http://localhost:33129/tests/dromaeo/cssquery-yui.html (next: http://localhost:33129/tests/dromaeo/cssquery-dojo.html) 05:22:03 INFO - PROCESS | 10330 | RSS: Main: 160604160 05:22:03 INFO - PROCESS | 10330 | 05:22:03 INFO - PROCESS | 10330 | __start_tp_report 05:22:03 INFO - PROCESS | 10330 | _x_x_mozilla_page_load 05:22:03 INFO - PROCESS | 10330 | _x_x_mozilla_page_load_details 05:22:03 INFO - PROCESS | 10330 | |i|pagename|runs| 05:22:03 INFO - PROCESS | 10330 | |0;dojo.html;3223.11364374797;3228.24136327963;3265.1837040739806;3271.541984122222;3287.4411350070486;5282.498162674539;5456.045192091388;5460.972695136519;5464.863378415542;5467.835964921053;5370.7046112463795;5477.698726570037;5491.752871120799;5522.5581953443725;5536.916946245809;4900.387451568554;4972.2044472884345;5011;5028.698278103326;5043.268726034741;4976.3530741003615;5040.697558146523;5050.964552266776;5076.6192535559985;5078.974605126969;4860.465348811628;4900.534449227335;5012.8997420051755;5013.373328333958;5022.8949631081105;4996.975015124901;5007.273945277951;5010;5017.8243761468175;5070.923936140924;4809.398825146856;4908.533689299511;4947.529984651488;4950.405951285833;5013.147764879979;5242.397124330712;5287.894242115136;5314.7608357624;5320.361556613192;5344.545713614309;5862.472377486004;5894.734736936848;5897.823065308047;5903.173555702205;5908.556858235606;5789.247397838296;5888.087346461305;5893.5579831512805;5897.64614123154;5951.49412299955;5412.621116521845;5438.510534051954;5442.319710036246;5444.428335024805;5448;6016.368281330485;6031.487323577545;6078.209832721806;6104.725287362079;6130.386961303834;5705.657660540381;5724.627899186623;5747.48272655463;5765.798197063083;5774.931637647049;5652.180433837153;5818.2436283282905;5839.766409343663;5847.356790753014;5854.356020837705;5842;5842.328132264759;5869.7945571904775;5881.9705901470215;5895.233619629421;5852.209951656472;5882.676452795137;5893.882122357614;5903.144044113579;5906.3207731110615;4430.180416622935;4467.7319360838455;4493.73037617744;4499.842505512292;4546.499885012646;3956.1296514766705;3966.2464131814863;3969.583193764671;3980.0646847990697;4000.4599379084034;5340.2256672783005;5449.182622606561;5493.697846618475;5497.532709719639;5502.889942201134;5808.941910580925;5829.213056237354;5872.677002764889;5880.970595146997;5920.615160014585;5442.6462279951675;5562.916556251659;5576.832695019156;5582.274304340491;5587.078132108238;4901.313816065754;4939.802407903644;5005.799768009311;5010.67430617016;5071.061853557104;5933.643981361132;5976.073708575178;6024.0662697282;6028.367021462771;6057.454829065406;5815.244018277766;5854.326752423355;5860;5860.38465961085;5875;5892.145638882424;5965.463108320272;5978.551608629457;5990.7903223386975;5993.850153746192;5727.31272247333;5755.7409916553015;5782.1615865698395;5818.679972601548;5932.080527518242;5919.6744179070565;5920.763169473173;5929.199558059607;5931.6441013539325;5935.258092738408;5756.913646295393;5764.6829424380385;5777.075667893117;5784.190213370048;5785.566082543742;5620.550355971594;5700.201971724045;5751.942480575308;5782.306123265235;5828.533717302521;5646.181303711021;5659.179418984307;5682.034054210877;5689.431056894443;5690.231818704422;5559.944400555943;5770.5095066919785;5792.102224155263;5801.071828507418;5834.504067154339;5652;5674.375818660027;5696.088625819849;5714.571407144397;5726.169705392778 05:22:03 INFO - PROCESS | 10330 | |1;ext.html;534.5616594392598;568.6161840757487;592.4164697772693;600.5015836855409;611.0955785437556;36197;36734.26531469372;36790.63209367906;36900;37121.25757484849;37751.811240943825;38022.61977380225;38180.23639527208;38414.423783643266;38544.421833672444;8328.708495202683;8457.830843383128;8483.787905302386;8513.95743021284;8514.872276915852;8335.66657333706;8555.315574754004;8632.611532481022;8656.740297791077;8669.089745576719;8699.739007829776;8718.912810871905;8725.912740872605;8745;8785.253253473431;8623.611937462829;8696.739097827107;8696.913030869673;8704;8744.781380465476;8589.31285497165;8636.17956294151;8666.480011199348;8733.03936566977;8743.475391476468;36483;36912.63087369119;37037.07407314839;37085.258294834224;37237;3046.6344038715274;3128.7340576051065;3387.1870751019824;3471.756977011585;3747.9812600937094;29760.55359169614;30323;30854.22864428385;31001.534976975363;31010.534841977387;3850.6534411902785;3862.304785138674;3870.2453021660785;3958.2875082485143;4063.6952228582677;250698;256255;261460;262272.6886365575;262378;50206;50908.745456273224;51061.744691276304;53807.73096134494;60573.69713151494;59835.40164598385;60413.69793151094;60455.395446044975;60589.394106059255;60709;16004.359825606845;16090.517284481484;16215.756763648555;16221.2700428481;16268.26792794327;12067.517299307929;12083.395830208454;12118.81821772674;12138.635840924786;12279.2018518796;20694.89652551758;20726.896365518074;20749.377518674464;20917.686234706493;20946.162153513993;7806.570638614817;7954.960225198953;8020.318272946864;8056.355491560661;8087.636056377477;1039.2361614213698;1044.3577200021932;1062.9202809789297;1093.7375029992904;1207.3661327802974;29671.703282966893;29753.553696694566;29823.850880745456;30235.69764302329;30497.847510762305;1075.7203127186988;1088.8911108889206;1100.3782862682558;1108.3626914524182;1132.5752842683994;14943.701125977419;15209.239538023276;15309.617259568377;15435.768463472832;15482.148481833383;343010;349015;350418;351570;352562;54654.72672636611;55280.44719552834;55543.16685249725;55573.16640250399;55581.44418555844;1344.5025340623836;1371.3143428285857;1375.0512146619;1378.3177327223088;1383.266868559665;28485;28597;29132;29423.85288073546;29509;41828;41986.580134198266;42148.57851421447;42622;42828.357574637026;217458;217981;220475;268646;270624;31957.20106997344;42918.78540607277;43304.56695433131;43569.128617428105;43619.56380436155;42834.78582607067;43158.35262471128;43553.56446435622;43798;44028.119437610425;36584.634153658124;36878;37068.44397333988;37334.813325933195;37742;37079.814600926824;39205.80397097996;40538;42870.35694464648;44447.11105777931;36538.8173059133;37394.06514837151;37394.43908341431;37432;37556;30589.694103058686;33521.66478335283;33534.66465335315;33910.66089339174;33973.49039764455;27524.311892202055;28156.571965344665;30096;30430.391392172474;30693.846530767205 05:22:03 INFO - PROCESS | 10330 | |2;jquery.html;361.286459242995;365.1728834190559;370.22622718518306;372.281496711347;377.8696349759332;13428.798568021488;15905.852709884162;16497.67004659906;16559.83440165598;17090;15938.20308984549;16015.19924003801;16056;16109.355625774984;16172;4583.19794036044;4787.066522028206;4800.111979283826;4802.783874725646;4828.951710482886;4713.622910167179;4760.190767569521;5390.9191362129595;5447.046766815811;5450.945490545103;3792.924141517168;5354.491323324298;5423.755930983096;5431.2396264522995;5488.286522752057;5345.732713364317;5421.5391691706445;5442.074847275972;5479.1781232815;5482.23248745176;5458.5087342139395;5468.9726551367385;5478.780848766045;5484.780608775644;5492.835214943518;19070.33253836109;19193.90403047976;19509.122089506007;19540.31608893696;19590.804091959184;2049.98975005124;2131.541718530523;2201.9889900550393;2226.0973543919185;2389.2439057292877;9325.813483730288;9585.616575336979;9617.903820961841;9706.51467426633;9895.109440150422;1823.6443893440785;1916.037462970912;1916.2047750183658;1927.7012063130237;1939.660559402113;55517.44482555163;57018.42981570214;59512.40487595155;59666.10500842447;59715;9659.130678238993;10018.64934727281;10158.593656253815;10248;10294.742631434274;13265.535706250235;13360.732785344238;13369.398377073056;13374.197548147142;13383.799243011363;7671.6164191790185;7680.923190768132;7720.9613951931005;7726.266004729542;7762.068551773823;7550.169481357047;7552.244775522514;7588.165301816795;7636.618169091523;7641.044869391326;4406;4411.551588868145;4424.446944131983;4435.401220835211;4473.507914129443;1806.4490330449075;1849.833514983658;1899.2877670873422;1908.59919416924;1913.550315675815;433.57726216938863;448.7487007275936;454.3820404250217;468.3583490617807;494.2857570810145;10403.739906502398;11027.062699670618;11122.110231181487;11172.720681982853;11313.377764222882;451.54845154845157;468.5104066250776;471.24130150457734;483.16894940701934;484.4670862051715;6029.155918171459;6144.56988010835;6175.042868355412;6201.844953876189;6243.157173781572;478567;482392;486786;490517;503873;42966.785166074595;56711.71644141753;67156.6642166786;68199.65900170467;69661.65169174122;508.90839648862817;512.779504812934;514.390447319927;518.289942778396;518.3365292425701;10145.594176233164;10327.586896524055;10428.165746740091;10493.737656558647;10513.526891290063;30365.69634303629;31309;31651;31899;31996.5200521997;45919.77040114778;46282.53717462917;46347.768261158475;46369.76815115903;46575.30137048015;7330.193678695446;7350.154732205865;7365.594892280976;7584.8483030340185;7649.732259371118;9086.591103400495;11505.539778409106;11571.305721656727;11917.344546049704;12337.691557711129;9837.9016209837;9882.703518894445;10294.404367322777;10424.426656533964;10466.738331541772;10133.543990520591;10203.132733717717;10225.48872556384;10238.897611023795;10622.8937710625;8513.339898719938;9833.950830245803;10225.693229203136;10303.742406439898;10748.838767418338;7679.424043196671;7766.88349674744;7916.683332666629;7975.72084977023;7997.840043198987;9199.218066464158;10785.552033149197;10844.783104337712;10869.076128529163;11030.669079927615 05:22:03 INFO - PROCESS | 10330 | |3;mootools.html;1465.6189390758402;1504.3080183115762;1658.3698194686017;1790.9194086266116;1792.2024699008946;6941.340572645603;7908.644111015004;7996.760097197086;8198.057223419308;8239.711610093655;7945.404094692893;8011.59942002899;8021.478603890743;8107.067687215972;8120.147384524628;2363.763623637631;2365.95268094638;2382.249591378719;2382.368672301846;2387.7612238776155;2274.317704688595;2285.942851428711;2333.708286464192;2338.567365037465;2345.4019225097577;2304.493011537459;2304.6312589985605;2312.0867257433306;2338.777816107467;2341.54339903718;2399.5200959808108;2406.0496104038807;2429.0648100481353;2434.85390876548;2440.707115146185;2348.471593891378;2364.8935797889135;2369.099742098009;2378.3340664613934;2385.0340612052146;8163.469374490639;8178.386621003389;8194;8239.464434811718;8268.958655206745;4989.376327959005;5104.387473503166;5129.538341549279;5137.51193636604;5138.922916156261;3257.7068063874126;3279.950800737991;3284.6222684391364;3310.2717402171725;3358.395488812013;1024.467277015955;1034.7775228325945;1052.0105696820685;1053.4522048534795;1120.1542835159403;11408.71478213043;11428.771424571461;11472.139589530736;11508.424578771028;11550.36472993985;4571.22289210835;4679.321498382716;4682.1338052460405;4696.647751418657;4724.244120940633;9824.607015719292;9856.112949834549;9864.654737084167;9888.802223955625;9911.702648920544;5133.614978876599;5133.8716532087;5136.409312928986;5137.049645815461;5162.819301324435;4036.1524079942956;4551.47658019332;4578.923952871072;4590.829338518656;4677.742724150205;3840.0591854995705;3857.228554289153;3884.825182866721;3906.7069969752383;3952.881413557598;1254.1597129922973;1268.4418855703461;1273.5669872243482;1281.1608396500308;1295.2875918244927;1069.005824583145;1070.7590792071878;1222.96048358896;1365.549368708324;1374.2098293481288;7638.656260468292;7672.462927595015;7754.612269386508;7920.6039698014865;7927.722529711433;481.1507688929043;487.60016786234945;529.6610169491529;531.452603818068;538.329779424611;6020.277566691937;6022.307434645072;6101.084837274356;6105.145279660851;6126.295476020226;9355.766105847408;9562.856557151648;9567.330286879991;9635.662751803653;9654.03459654043;9282.535873206447;9433.575489103006;9481.24150067993;9544.52277386128;9567.282453815991;7523;7532.962335188289;7555.886661700079;7587.279208475186;7597.544147351176;7591.089069311718;7619.428542859197;7702.075750909927;7740.7677769667;7772.106207786177;8755.737327880173;8868.911310886808;8947.507887066275;8972.41679290844;9077.137671921157;9075.682351117679;9184.357095003286;9275.118863708207;9280.767980800534;9310.394824336396;6311.90532142009;6929.965350173418;7105.147382314155;7300;7398;7738.380929525511;7766.495177813424;7770.689172433265;7786.416018798726;7814.648340824563;7099.893501597377;7214.134303883568;7292.270772922665;7426.2945020223;7444.888326675213;7132.964335178291;7149.571025738473;7162.212156662658;7194.712211511481;7274.6726397313305;7369.410447164107;7373.889391659237;7446.069241344832;7450.925490745023;7471.215522370073;6742.157230346207;6753.223379311442;6771.119754431892;6803.421709154777;6823.727050917908;6607.141071660653;6715.395614394728;6728.05807187004;6756.223034351113;6772.966135169293 05:22:03 INFO - PROCESS | 10330 | |4;prototype.html;340.4688685650386;345.48350216426445;347.95128681984545;349.83557727867907;351.01890216843935;6190.133381326618;6202.131701561785;6220.84447888803;6332.430081292689;6353.682315884211;6197.783077592285;6242.812715618538;6261.436470717635;6268.623882567049;6273.654948977815;4810.302506136608;4812.759362031902;4814.542618451259;4815.735134567615;4825.7587120644;4818.807247710088;4820.590249828769;4825.541573550507;4829.420469543659;4844.370231869852;4700.976495117537;4776.785044672981;4783.71297722136;4802.83190088347;4816.494268101851;4757.429108506966;4759.643026772988;4769.403824521934;4785.59322457588;4815.927761083586;4184.686148538872;4185.058361868586;4190.748555086705;4193.077522944947;4203.159368126387;5970.223870896799;5978.910316345258;6013.639181649115;6024.277086749575;6024.939750602482;5464.9453505464835;5598.664080155204;5605.7197140142825;5606.55147588192;5607.607467477278;6688;6705.932940670579;6733.124693789825;6757.324267573253;6764.9323506764795;4657.604103651193;4659.836905708284;4668.883277918079;4670.486246512881;4677.228257337535;6693.698783554752;6865.656717164122;6952.93047069533;7065.0815393998455;7084.43324534036;4703.153432382135;4742.359781429532;4784.497627749106;4799.256115302133;4800.35195248644;4840.7337596432535;4841.15279826029;4895.066448752723;4910.214365701542;4921.7785199666105;5622.85942851432;5636.210930469738;5637.887242255214;5642.181883626933;5654.830355089354;6560.606363618198;6744.123263975652;6744.6627668616375;6752.93247067523;6764.391204791593;1653.8346165383366;1686.8228835972045;1691.2389424758908;1695.9491215263563;1708.5643160994116;1149.4827327702567;1165.5862168930078;1171.0572988744143;1176.0650283025016;1176.5235079792697;6213;6263.185785847902;6264.404881536247;6278.434940855345;6288.685565721696;6838.316168383221;6840.794776156723;6842.6578671066245;6849.623270720059;6852.862942741117;6192.752289908443;6210.689465526705;6275.058741188767;6277.748890044439;6281.560290779602;3710.07248187953;3742.7941463219786;3744.737868349244;3759.4172903200047;3765.9623403765613;7277.345038946521;7291.270872912773;7299.598522081336;7328.534293141393;7345.19202887682;7000.719971201095;7106.751263705745;7128.180259270147;7174.964125179341;7190.892136617955;7286;7311.415086793044;7320.597367144752;7324.047873776375;7325.047743793273;6919.827004324932;6970.128733908262;6972.51192416526;6975.755848545276;6978.057962175041;6738.898916516354;6853.657317134223;6873.072135261876;6888.483363747639;6896;7269.818254543678;7277.890831637424;7291.8541629168185;7293.744718934812;7307.926920730724;4663.556962088596;4701.271302948048;4709.976450117728;4711.929321060118;4723.84265854854;6683;6831.077804496329;6852.828679283058;6994.125734283215;7023.894641580483;6813.89779153323;6825.624590647562;6829.726810927706;6832.111825462658;6853.623050732258;6754.86490270182;6770.1537307836525;6771.45828333742;6786.151731033621;6797.762078327432;6521.608703477807;6534.575252608565;6662.933370666231;6664.8000559983275;6671.733130674913;6828.829279268058;6842.24735279109;6850.246472887879;6860.279670634512;6872.140982377203;6602.3397660233595;6663.733450662113;6671.799846004627;6674.566153200027;6680.665966701548 05:22:03 INFO - PROCESS | 10330 | |5;yui.html;634.771482266384;656.1142457682126;746.537146968879;746.7423738810111;820.1757233979849;13204.405801738922;13342.266175360352;13396.866031339683;13481.258530780804;13526.864731352684;12740.362981850894;12772.361381930912;12777.808332875014;12785.424655890483;12847.357632118381;659.6899457255082;779.2246714519061;803.8151225218203;807.870740681491;808.5512540539997;813.9715109971153;817.2971244729528;817.668844118133;820.4011071917504;821.1993306526119;852.1010334097525;852.1819053708448;854.8033952191;855.5465603230298;859.1923591823665;838.1534650003509;844.2823599940064;850.6852464588111;851.8764779107057;852.0499642898186;621.9036049412304;622.9439350458481;623.5136593457111;625.871696302257;625.9061140828867;13039.217646941213;13094.934525327408;13099.148555343872;13104.344782760823;13141.540046098437;12706.364681765876;12993.545225917142;13110.737785244242;13352.86647133526;13359.398827052708;10444.582216711322;10492.475376231157;10592.632034675147;10751.892481075167;10910;3613.9457908131135;3630.364686179908;3682.834272457719;3695.57500887396;3736.290104880064;44944.3258351125;45074.77462612666;45243.77378113088;45335;45405.318920216225;9896.505174741378;10129.694998611933;10176.847347289797;10186.949065254626;10560.366378017343;17907.641847163246;17925.28298868031;17931.910340448216;17937.282508699765;18054.819451805575;7629.237076292437;8036.437449378487;8039.557824319719;8043.839123217503;8131.064927533409;4144.564820693844;4375.431193944767;4433.046894917544;4443.422355093817;4478.865634030984;3029.8636561354792;3047.9847600761855;3050.8016978896744;3055.511118221074;3086.8147911125407;565.2736233939369;572.3601880612017;581.6364772017489;587.7678317064821;590.8168467775004;678.1184460201816;711.0652074602244;714.4067036656902;722.703691486488;727.287258486686;8609.956950215208;9057.81884362309;9208.171264586219;9343.486108264111;9674.951625241829;701.8701540215077;728.9854202915913;732.5421611492817;735.63586024918;741.23282402714;4021.597840215955;4184.4351012613515;4192.203481338597;4227.936580951288;4250.85122020734;53199;53247.467525325024;53448.73275633597;53852.192217116775;55347.16979245315;47664.76167619209;48240;48939;49367;50019.499805001484;39576.2508498982;40703.18593628111;41510.584894151274;41844.16311673688;42149.36775948363;8958.415841584158;9025.277977761632;9114.954425228098;9161.175494205554;9251.398659087137;32479;32958.34083318368;33740.49389259212;33743.98768036963;33875;40691;41304.79347603243;41891.581084188765;43816;43948.56051439445;11489.82765258505;11494.137939654727;11558;11577.536898523964;11578.36319002463;11166.888331116585;11465;11583.594574189863;11673.824892626448;12006.699832504257;11373.974534691843;11502.367369794407;11689.88310116922;11881.405929703307;12276.140670153361;11046.122159233111;11250.099992000783;11444.084473241954;11671.59149429766;11734.530618775154;11076.446177690923;11252.774944501229;11519.424028798694;11766.647000589996;12133.939330303292;9387.249020078514;9522.666706665234;9527.952360238154;9564;9748.805023899624;9619.56711947978;9784.706458806248;9786.902130978599;9802.166815820736;9880.160186384237 05:22:03 INFO - PROCESS | 10330 | __end_tp_report 05:22:03 INFO - PROCESS | 10330 | __start_cc_report 05:22:03 INFO - PROCESS | 10330 | _x_x_mozilla_cycle_collect,310 05:22:03 INFO - PROCESS | 10330 | __end_cc_report 05:22:03 INFO - PROCESS | 10330 | __startTimestamp1455196923806__endTimestamp 05:22:03 INFO - PROCESS | 10330 | 05:22:03 INFO - PROCESS | 10330 | ------- Summary: start ------- 05:22:03 INFO - PROCESS | 10330 | Number of tests: 6 05:22:03 INFO - PROCESS | 10330 | 05:22:03 INFO - PROCESS | 10330 | [#0] dojo.html Cycles:165 Average:5439.14 Median:5682.03 stddev:612.46 (10.8%) stddev-sans-first:589.15 05:22:03 INFO - PROCESS | 10330 | Values: 3223.1 3228.2 3265.2 3271.5 3287.4 5282.5 5456.0 5461.0 5464.9 5467.8 5370.7 5477.7 5491.8 5522.6 5536.9 4900.4 4972.2 5011.0 5028.7 5043.3 4976.4 5040.7 5051.0 5076.6 5079.0 4860.5 4900.5 5012.9 5013.4 5022.9 4997.0 5007.3 5010.0 5017.8 5070.9 4809.4 4908.5 4947.5 4950.4 5013.1 5242.4 5287.9 5314.8 5320.4 5344.5 5862.5 5894.7 5897.8 5903.2 5908.6 5789.2 5888.1 5893.6 5897.6 5951.5 5412.6 5438.5 5442.3 5444.4 5448.0 6016.4 6031.5 6078.2 6104.7 6130.4 5705.7 5724.6 5747.5 5765.8 5774.9 5652.2 5818.2 5839.8 5847.4 5854.4 5842.0 5842.3 5869.8 5882.0 5895.2 5852.2 5882.7 5893.9 5903.1 5906.3 4430.2 4467.7 4493.7 4499.8 4546.5 3956.1 3966.2 3969.6 3980.1 4000.5 5340.2 5449.2 5493.7 5497.5 5502.9 5808.9 5829.2 5872.7 5881.0 5920.6 5442.6 5562.9 5576.8 5582.3 5587.1 4901.3 4939.8 5005.8 5010.7 5071.1 5933.6 5976.1 6024.1 6028.4 6057.5 5815.2 5854.3 5860.0 5860.4 5875.0 5892.1 5965.5 5978.6 5990.8 5993.9 5727.3 5755.7 5782.2 5818.7 5932.1 5919.7 5920.8 5929.2 5931.6 5935.3 5756.9 5764.7 5777.1 5784.2 5785.6 5620.6 5700.2 5751.9 5782.3 5828.5 5646.2 5659.2 5682.0 5689.4 5690.2 5559.9 5770.5 5792.1 5801.1 5834.5 5652.0 5674.4 5696.1 5714.6 5726.2 05:22:03 INFO - PROCESS | 10330 | 05:22:03 INFO - PROCESS | 10330 | [#1] ext.html Cycles:180 Average:45804.15 Median:37074.13 stddev:74915.11 (202.1%) stddev-sans-first:75048.15 05:22:03 INFO - PROCESS | 10330 | Values: 534.6 568.6 592.4 600.5 611.1 36197.0 36734.3 36790.6 36900.0 37121.3 37751.8 38022.6 38180.2 38414.4 38544.4 8328.7 8457.8 8483.8 8514.0 8514.9 8335.7 8555.3 8632.6 8656.7 8669.1 8699.7 8718.9 8725.9 8745.0 8785.3 8623.6 8696.7 8696.9 8704.0 8744.8 8589.3 8636.2 8666.5 8733.0 8743.5 36483.0 36912.6 37037.1 37085.3 37237.0 3046.6 3128.7 3387.2 3471.8 3748.0 29760.6 30323.0 30854.2 31001.5 31010.5 3850.7 3862.3 3870.2 3958.3 4063.7 250698.0 256255.0 261460.0 262272.7 262378.0 50206.0 50908.7 51061.7 53807.7 60573.7 59835.4 60413.7 60455.4 60589.4 60709.0 16004.4 16090.5 16215.8 16221.3 16268.3 12067.5 12083.4 12118.8 12138.6 12279.2 20694.9 20726.9 20749.4 20917.7 20946.2 7806.6 7955.0 8020.3 8056.4 8087.6 1039.2 1044.4 1062.9 1093.7 1207.4 29671.7 29753.6 29823.9 30235.7 30497.8 1075.7 1088.9 1100.4 1108.4 1132.6 14943.7 15209.2 15309.6 15435.8 15482.1 343010.0 349015.0 350418.0 351570.0 352562.0 54654.7 55280.4 55543.2 55573.2 55581.4 1344.5 1371.3 1375.1 1378.3 1383.3 28485.0 28597.0 29132.0 29423.9 29509.0 41828.0 41986.6 42148.6 42622.0 42828.4 217458.0 217981.0 220475.0 268646.0 270624.0 31957.2 42918.8 43304.6 43569.1 43619.6 42834.8 43158.4 43553.6 43798.0 44028.1 36584.6 36878.0 37068.4 37334.8 37742.0 37079.8 39205.8 40538.0 42870.4 44447.1 36538.8 37394.1 37394.4 37432.0 37556.0 30589.7 33521.7 33534.7 33910.7 33973.5 27524.3 28156.6 30096.0 30430.4 30693.8 05:22:03 INFO - PROCESS | 10330 | 05:22:03 INFO - PROCESS | 10330 | [#2] jquery.html Cycles:180 Average:25509.16 Median:46101.15 stddev:79810.86 (173.1%) stddev-sans-first:80012.41 05:22:03 INFO - PROCESS | 10330 | Values: 361.3 365.2 370.2 372.3 377.9 13428.8 15905.9 16497.7 16559.8 17090.0 15938.2 16015.2 16056.0 16109.4 16172.0 4583.2 4787.1 4800.1 4802.8 4829.0 4713.6 4760.2 5390.9 5447.0 5450.9 3792.9 5354.5 5423.8 5431.2 5488.3 5345.7 5421.5 5442.1 5479.2 5482.2 5458.5 5469.0 5478.8 5484.8 5492.8 19070.3 19193.9 19509.1 19540.3 19590.8 2050.0 2131.5 2202.0 2226.1 2389.2 9325.8 9585.6 9617.9 9706.5 9895.1 1823.6 1916.0 1916.2 1927.7 1939.7 55517.4 57018.4 59512.4 59666.1 59715.0 9659.1 10018.6 10158.6 10248.0 10294.7 13265.5 13360.7 13369.4 13374.2 13383.8 7671.6 7680.9 7721.0 7726.3 7762.1 7550.2 7552.2 7588.2 7636.6 7641.0 4406.0 4411.6 4424.4 4435.4 4473.5 1806.4 1849.8 1899.3 1908.6 1913.6 433.6 448.7 454.4 468.4 494.3 10403.7 11027.1 11122.1 11172.7 11313.4 451.5 468.5 471.2 483.2 484.5 6029.2 6144.6 6175.0 6201.8 6243.2 478567.0 482392.0 486786.0 490517.0 503873.0 42966.8 56711.7 67156.7 68199.7 69661.7 508.9 512.8 514.4 518.3 518.3 10145.6 10327.6 10428.2 10493.7 10513.5 30365.7 31309.0 31651.0 31899.0 31996.5 45919.8 46282.5 46347.8 46369.8 46575.3 7330.2 7350.2 7365.6 7584.8 7649.7 9086.6 11505.5 11571.3 11917.3 12337.7 9837.9 9882.7 10294.4 10424.4 10466.7 10133.5 10203.1 10225.5 10238.9 10622.9 8513.3 9834.0 10225.7 10303.7 10748.8 7679.4 7766.9 7916.7 7975.7 7997.8 9199.2 10785.6 10844.8 10869.1 11030.7 05:22:03 INFO - PROCESS | 10330 | 05:22:03 INFO - PROCESS | 10330 | [#3] mootools.html Cycles:180 Average:5722.07 Median:6459.52 stddev:2989.41 (46.3%) stddev-sans-first:2980.67 05:22:03 INFO - PROCESS | 10330 | Values: 1465.6 1504.3 1658.4 1790.9 1792.2 6941.3 7908.6 7996.8 8198.1 8239.7 7945.4 8011.6 8021.5 8107.1 8120.1 2363.8 2366.0 2382.2 2382.4 2387.8 2274.3 2285.9 2333.7 2338.6 2345.4 2304.5 2304.6 2312.1 2338.8 2341.5 2399.5 2406.0 2429.1 2434.9 2440.7 2348.5 2364.9 2369.1 2378.3 2385.0 8163.5 8178.4 8194.0 8239.5 8269.0 4989.4 5104.4 5129.5 5137.5 5138.9 3257.7 3280.0 3284.6 3310.3 3358.4 1024.5 1034.8 1052.0 1053.5 1120.2 11408.7 11428.8 11472.1 11508.4 11550.4 4571.2 4679.3 4682.1 4696.6 4724.2 9824.6 9856.1 9864.7 9888.8 9911.7 5133.6 5133.9 5136.4 5137.0 5162.8 4036.2 4551.5 4578.9 4590.8 4677.7 3840.1 3857.2 3884.8 3906.7 3952.9 1254.2 1268.4 1273.6 1281.2 1295.3 1069.0 1070.8 1223.0 1365.5 1374.2 7638.7 7672.5 7754.6 7920.6 7927.7 481.2 487.6 529.7 531.5 538.3 6020.3 6022.3 6101.1 6105.1 6126.3 9355.8 9562.9 9567.3 9635.7 9654.0 9282.5 9433.6 9481.2 9544.5 9567.3 7523.0 7533.0 7555.9 7587.3 7597.5 7591.1 7619.4 7702.1 7740.8 7772.1 8755.7 8868.9 8947.5 8972.4 9077.1 9075.7 9184.4 9275.1 9280.8 9310.4 6311.9 6930.0 7105.1 7300.0 7398.0 7738.4 7766.5 7770.7 7786.4 7814.6 7099.9 7214.1 7292.3 7426.3 7444.9 7133.0 7149.6 7162.2 7194.7 7274.7 7369.4 7373.9 7446.1 7450.9 7471.2 6742.2 6753.2 6771.1 6803.4 6823.7 6607.1 6715.4 6728.1 6756.2 6773.0 05:22:03 INFO - PROCESS | 10330 | 05:22:03 INFO - PROCESS | 10330 | [#4] prototype.html Cycles:180 Average:5618.23 Median:6266.51 stddev:1703.48 (27.2%) stddev-sans-first:1661.56 05:22:03 INFO - PROCESS | 10330 | Values: 340.5 345.5 348.0 349.8 351.0 6190.1 6202.1 6220.8 6332.4 6353.7 6197.8 6242.8 6261.4 6268.6 6273.7 4810.3 4812.8 4814.5 4815.7 4825.8 4818.8 4820.6 4825.5 4829.4 4844.4 4701.0 4776.8 4783.7 4802.8 4816.5 4757.4 4759.6 4769.4 4785.6 4815.9 4184.7 4185.1 4190.7 4193.1 4203.2 5970.2 5978.9 6013.6 6024.3 6024.9 5464.9 5598.7 5605.7 5606.6 5607.6 6688.0 6705.9 6733.1 6757.3 6764.9 4657.6 4659.8 4668.9 4670.5 4677.2 6693.7 6865.7 6952.9 7065.1 7084.4 4703.2 4742.4 4784.5 4799.3 4800.4 4840.7 4841.2 4895.1 4910.2 4921.8 5622.9 5636.2 5637.9 5642.2 5654.8 6560.6 6744.1 6744.7 6752.9 6764.4 1653.8 1686.8 1691.2 1695.9 1708.6 1149.5 1165.6 1171.1 1176.1 1176.5 6213.0 6263.2 6264.4 6278.4 6288.7 6838.3 6840.8 6842.7 6849.6 6852.9 6192.8 6210.7 6275.1 6277.7 6281.6 3710.1 3742.8 3744.7 3759.4 3766.0 7277.3 7291.3 7299.6 7328.5 7345.2 7000.7 7106.8 7128.2 7175.0 7190.9 7286.0 7311.4 7320.6 7324.0 7325.0 6919.8 6970.1 6972.5 6975.8 6978.1 6738.9 6853.7 6873.1 6888.5 6896.0 7269.8 7277.9 7291.9 7293.7 7307.9 4663.6 4701.3 4710.0 4711.9 4723.8 6683.0 6831.1 6852.8 6994.1 7023.9 6813.9 6825.6 6829.7 6832.1 6853.6 6754.9 6770.2 6771.5 6786.2 6797.8 6521.6 6534.6 6662.9 6664.8 6671.7 6828.8 6842.2 6850.2 6860.3 6872.1 6602.3 6663.7 6671.8 6674.6 6680.7 05:22:03 INFO - PROCESS | 10330 | 05:22:03 INFO - PROCESS | 10330 | [#5] yui.html Cycles:180 Average:13367.33 Median:24190.80 stddev:14829.32 (61.3%) stddev-sans-first:14840.09 05:22:03 INFO - PROCESS | 10330 | Values: 634.8 656.1 746.5 746.7 820.2 13204.4 13342.3 13396.9 13481.3 13526.9 12740.4 12772.4 12777.8 12785.4 12847.4 659.7 779.2 803.8 807.9 808.6 814.0 817.3 817.7 820.4 821.2 852.1 852.2 854.8 855.5 859.2 838.2 844.3 850.7 851.9 852.0 621.9 622.9 623.5 625.9 625.9 13039.2 13094.9 13099.1 13104.3 13141.5 12706.4 12993.5 13110.7 13352.9 13359.4 10444.6 10492.5 10592.6 10751.9 10910.0 3613.9 3630.4 3682.8 3695.6 3736.3 44944.3 45074.8 45243.8 45335.0 45405.3 9896.5 10129.7 10176.8 10186.9 10560.4 17907.6 17925.3 17931.9 17937.3 18054.8 7629.2 8036.4 8039.6 8043.8 8131.1 4144.6 4375.4 4433.0 4443.4 4478.9 3029.9 3048.0 3050.8 3055.5 3086.8 565.3 572.4 581.6 587.8 590.8 678.1 711.1 714.4 722.7 727.3 8610.0 9057.8 9208.2 9343.5 9675.0 701.9 729.0 732.5 735.6 741.2 4021.6 4184.4 4192.2 4227.9 4250.9 53199.0 53247.5 53448.7 53852.2 55347.2 47664.8 48240.0 48939.0 49367.0 50019.5 39576.3 40703.2 41510.6 41844.2 42149.4 8958.4 9025.3 9115.0 9161.2 9251.4 32479.0 32958.3 33740.5 33744.0 33875.0 40691.0 41304.8 41891.6 43816.0 43948.6 11489.8 11494.1 11558.0 11577.5 11578.4 11166.9 11465.0 11583.6 11673.8 12006.7 11374.0 11502.4 11689.9 11881.4 12276.1 11046.1 11250.1 11444.1 11671.6 11734.5 11076.4 11252.8 11519.4 11766.6 12133.9 9387.2 9522.7 9528.0 9564.0 9748.8 9619.6 9784.7 9786.9 9802.2 9880.2 05:22:03 INFO - PROCESS | 10330 | -------- Summary: end -------- 05:22:03 INFO - PROCESS | 10330 | 05:22:04 INFO - TEST-INFO | 10330: exit 0 05:22:04 INFO - TEST-OK | dromaeo_css | took 1112199ms 05:22:04 INFO - TEST-START | kraken 05:22:04 INFO - operating with platform_type : linux_ 05:22:04 INFO - Initialising browser for kraken test... 05:22:04 INFO - TEST-INFO | started process 10574 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpC8r_jx/profile http://localhost:33129/getInfo.html) 05:22:08 INFO - PROCESS | 10574 | 05:22:08 INFO - PROCESS | 10574 | (process:10646): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 05:22:09 INFO - PROCESS | 10574 | __metrics Screen width/height:1600/1200 05:22:09 INFO - PROCESS | 10574 | colorDepth:24 05:22:09 INFO - PROCESS | 10574 | Browser inner width/height: 1024/697 05:22:09 INFO - PROCESS | 10574 | __metrics 05:22:10 INFO - TEST-INFO | 10574: exit 0 05:22:10 INFO - Browser initialized. 05:22:10 INFO - Running cycle 1/1 for kraken test... 05:22:10 INFO - TEST-INFO | started process 10695 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpC8r_jx/profile -tp file:/builds/slave/test-pgo/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 05:22:11 INFO - PROCESS | 10695 | 05:22:11 INFO - PROCESS | 10695 | (process:10753): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 05:22:21 INFO - PROCESS | 10695 | RSS: Main: 155893760 05:22:21 INFO - PROCESS | 10695 | 05:22:24 INFO - PROCESS | 10695 | Cycle 1(1): loaded http://localhost:33129/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:33129/tests/kraken/driver.html?testName=audio-beat-detection) 05:22:24 INFO - PROCESS | 10695 | RSS: Main: 158978048 05:22:24 INFO - PROCESS | 10695 | 05:22:27 INFO - PROCESS | 10695 | Cycle 1(1): loaded http://localhost:33129/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:33129/tests/kraken/driver.html?testName=audio-dft) 05:22:28 INFO - PROCESS | 10695 | RSS: Main: 161898496 05:22:28 INFO - PROCESS | 10695 | 05:22:31 INFO - PROCESS | 10695 | Cycle 1(1): loaded http://localhost:33129/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:33129/tests/kraken/driver.html?testName=audio-fft) 05:22:31 INFO - PROCESS | 10695 | RSS: Main: 154750976 05:22:31 INFO - PROCESS | 10695 | 05:22:33 INFO - PROCESS | 10695 | Cycle 1(1): loaded http://localhost:33129/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:33129/tests/kraken/driver.html?testName=audio-oscillator) 05:22:34 INFO - PROCESS | 10695 | RSS: Main: 154157056 05:22:34 INFO - PROCESS | 10695 | 05:22:36 INFO - PROCESS | 10695 | Cycle 1(1): loaded http://localhost:33129/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:33129/tests/kraken/driver.html?testName=imaging-gaussian-blur) 05:22:37 INFO - PROCESS | 10695 | RSS: Main: 154423296 05:22:37 INFO - PROCESS | 10695 | 05:22:40 INFO - PROCESS | 10695 | Cycle 1(1): loaded http://localhost:33129/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:33129/tests/kraken/driver.html?testName=imaging-darkroom) 05:22:40 INFO - PROCESS | 10695 | RSS: Main: 157024256 05:22:40 INFO - PROCESS | 10695 | 05:22:44 INFO - PROCESS | 10695 | Cycle 1(1): loaded http://localhost:33129/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:33129/tests/kraken/driver.html?testName=imaging-desaturate) 05:22:44 INFO - PROCESS | 10695 | RSS: Main: 157224960 05:22:44 INFO - PROCESS | 10695 | 05:22:47 INFO - PROCESS | 10695 | Cycle 1(1): loaded http://localhost:33129/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:33129/tests/kraken/driver.html?testName=json-parse-financial) 05:22:48 INFO - PROCESS | 10695 | RSS: Main: 157507584 05:22:48 INFO - PROCESS | 10695 | 05:22:49 INFO - PROCESS | 10695 | Cycle 1(1): loaded http://localhost:33129/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:33129/tests/kraken/driver.html?testName=json-stringify-tinderbox) 05:22:50 INFO - PROCESS | 10695 | RSS: Main: 159154176 05:22:50 INFO - PROCESS | 10695 | 05:22:52 INFO - PROCESS | 10695 | Cycle 1(1): loaded http://localhost:33129/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:33129/tests/kraken/driver.html?testName=stanford-crypto-aes) 05:22:52 INFO - PROCESS | 10695 | RSS: Main: 159617024 05:22:52 INFO - PROCESS | 10695 | 05:22:54 INFO - PROCESS | 10695 | Cycle 1(1): loaded http://localhost:33129/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:33129/tests/kraken/driver.html?testName=stanford-crypto-ccm) 05:22:55 INFO - PROCESS | 10695 | RSS: Main: 157794304 05:22:55 INFO - PROCESS | 10695 | 05:22:57 INFO - PROCESS | 10695 | Cycle 1(1): loaded http://localhost:33129/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:33129/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 05:22:58 INFO - PROCESS | 10695 | RSS: Main: 157192192 05:22:58 INFO - PROCESS | 10695 | 05:23:01 INFO - PROCESS | 10695 | Cycle 1(1): loaded http://localhost:33129/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:33129/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 05:23:01 INFO - PROCESS | 10695 | RSS: Main: 158568448 05:23:01 INFO - PROCESS | 10695 | 05:23:03 INFO - PROCESS | 10695 | Cycle 1(1): loaded http://localhost:33129/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:33129/tests/kraken/driver.html?testName=ai-astar) 05:23:03 INFO - PROCESS | 10695 | RSS: Main: 159727616 05:23:03 INFO - PROCESS | 10695 | 05:23:03 INFO - PROCESS | 10695 | __start_tp_report 05:23:03 INFO - PROCESS | 10695 | _x_x_mozilla_page_load 05:23:03 INFO - PROCESS | 10695 | _x_x_mozilla_page_load_details 05:23:03 INFO - PROCESS | 10695 | |i|pagename|runs| 05:23:03 INFO - PROCESS | 10695 | |0;ai-astar;111;106;113;110;110;124;111;112;112;110 05:23:03 INFO - PROCESS | 10695 | |1;audio-beat-detection;158;134;152;159;128;159;146;126;160;127 05:23:03 INFO - PROCESS | 10695 | |2;audio-dft;163;163;162;161;162;163;163;165;171;164 05:23:03 INFO - PROCESS | 10695 | |3;audio-fft;73;74;75;74;73;147;73;72;72;74 05:23:03 INFO - PROCESS | 10695 | |4;audio-oscillator;95;95;152;95;96;96;135;96;104;145 05:23:03 INFO - PROCESS | 10695 | |5;imaging-gaussian-blur;120;115;116;115;115;115;116;116;115;116 05:23:03 INFO - PROCESS | 10695 | |6;imaging-darkroom;146;147;147;147;146;147;147;147;147;146 05:23:03 INFO - PROCESS | 10695 | |7;imaging-desaturate;97;97;97;97;97;97;97;97;96;96 05:23:03 INFO - PROCESS | 10695 | |8;json-parse-financial;58;57;58;61;57;59;57;60;55;55 05:23:03 INFO - PROCESS | 10695 | |9;json-stringify-tinderbox;67;67;67;67;68;67;67;67;67;67 05:23:03 INFO - PROCESS | 10695 | |10;stanford-crypto-aes;91;93;86;85;85;84;87;84;84;84 05:23:03 INFO - PROCESS | 10695 | |11;stanford-crypto-ccm;124;119;121;123;128;131;118;118;122;127 05:23:03 INFO - PROCESS | 10695 | |12;stanford-crypto-pbkdf2;146;164;160;153;153;148;152;151;152;145 05:23:03 INFO - PROCESS | 10695 | |13;stanford-crypto-sha256-iterative;70;69;68;72;68;68;68;68;69;67 05:23:03 INFO - PROCESS | 10695 | __end_tp_report 05:23:03 INFO - PROCESS | 10695 | __start_cc_report 05:23:03 INFO - PROCESS | 10695 | _x_x_mozilla_cycle_collect,765 05:23:03 INFO - PROCESS | 10695 | __end_cc_report 05:23:03 INFO - PROCESS | 10695 | __startTimestamp1455196983707__endTimestamp 05:23:03 INFO - PROCESS | 10695 | 05:23:03 INFO - PROCESS | 10695 | ------- Summary: start ------- 05:23:03 INFO - PROCESS | 10695 | Number of tests: 14 05:23:03 INFO - PROCESS | 10695 | 05:23:03 INFO - PROCESS | 10695 | [#0] ai-astar Cycles:10 Average:111.90 Median:111.50 stddev:4.65 (4.2%) stddev-sans-first:4.92 05:23:03 INFO - PROCESS | 10695 | Values: 111.0 106.0 113.0 110.0 110.0 124.0 111.0 112.0 112.0 110.0 05:23:03 INFO - PROCESS | 10695 | 05:23:03 INFO - PROCESS | 10695 | [#1] audio-beat-detection Cycles:10 Average:144.90 Median:155.00 stddev:14.65 (9.4%) stddev-sans-first:14.75 05:23:03 INFO - PROCESS | 10695 | Values: 158.0 134.0 152.0 159.0 128.0 159.0 146.0 126.0 160.0 127.0 05:23:03 INFO - PROCESS | 10695 | 05:23:03 INFO - PROCESS | 10695 | [#2] audio-dft Cycles:10 Average:163.70 Median:163.00 stddev:2.79 (1.7%) stddev-sans-first:2.95 05:23:03 INFO - PROCESS | 10695 | Values: 163.0 163.0 162.0 161.0 162.0 163.0 163.0 165.0 171.0 164.0 05:23:03 INFO - PROCESS | 10695 | 05:23:03 INFO - PROCESS | 10695 | [#3] audio-fft Cycles:10 Average:80.70 Median:73.50 stddev:23.31 (31.7%) stddev-sans-first:24.56 05:23:03 INFO - PROCESS | 10695 | Values: 73.0 74.0 75.0 74.0 73.0 147.0 73.0 72.0 72.0 74.0 05:23:03 INFO - PROCESS | 10695 | 05:23:03 INFO - PROCESS | 10695 | [#4] audio-oscillator Cycles:10 Average:110.90 Median:95.00 stddev:23.34 (24.6%) stddev-sans-first:24.04 05:23:03 INFO - PROCESS | 10695 | Values: 95.0 95.0 152.0 95.0 96.0 96.0 135.0 96.0 104.0 145.0 05:23:03 INFO - PROCESS | 10695 | 05:23:03 INFO - PROCESS | 10695 | [#5] imaging-gaussian-blur Cycles:10 Average:115.90 Median:116.00 stddev:1.52 (1.3%) stddev-sans-first:0.53 05:23:03 INFO - PROCESS | 10695 | Values: 120.0 115.0 116.0 115.0 115.0 115.0 116.0 116.0 115.0 116.0 05:23:03 INFO - PROCESS | 10695 | 05:23:03 INFO - PROCESS | 10695 | [#6] imaging-darkroom Cycles:10 Average:146.70 Median:147.00 stddev:0.48 (0.3%) stddev-sans-first:0.44 05:23:03 INFO - PROCESS | 10695 | Values: 146.0 147.0 147.0 147.0 146.0 147.0 147.0 147.0 147.0 146.0 05:23:03 INFO - PROCESS | 10695 | 05:23:03 INFO - PROCESS | 10695 | [#7] imaging-desaturate Cycles:10 Average:96.80 Median:97.00 stddev:0.42 (0.4%) stddev-sans-first:0.44 05:23:03 INFO - PROCESS | 10695 | Values: 97.0 97.0 97.0 97.0 97.0 97.0 97.0 97.0 96.0 96.0 05:23:03 INFO - PROCESS | 10695 | 05:23:03 INFO - PROCESS | 10695 | [#8] json-parse-financial Cycles:10 Average:57.70 Median:58.00 stddev:1.95 (3.4%) stddev-sans-first:2.06 05:23:03 INFO - PROCESS | 10695 | Values: 58.0 57.0 58.0 61.0 57.0 59.0 57.0 60.0 55.0 55.0 05:23:03 INFO - PROCESS | 10695 | 05:23:03 INFO - PROCESS | 10695 | [#9] json-stringify-tinderbox Cycles:10 Average:67.10 Median:67.00 stddev:0.32 (0.5%) stddev-sans-first:0.33 05:23:03 INFO - PROCESS | 10695 | Values: 67.0 67.0 67.0 67.0 68.0 67.0 67.0 67.0 67.0 67.0 05:23:03 INFO - PROCESS | 10695 | 05:23:03 INFO - PROCESS | 10695 | [#10] stanford-crypto-aes Cycles:10 Average:86.30 Median:85.50 stddev:3.20 (3.7%) stddev-sans-first:2.91 05:23:03 INFO - PROCESS | 10695 | Values: 91.0 93.0 86.0 85.0 85.0 84.0 87.0 84.0 84.0 84.0 05:23:03 INFO - PROCESS | 10695 | 05:23:03 INFO - PROCESS | 10695 | [#11] stanford-crypto-ccm Cycles:10 Average:123.10 Median:123.50 stddev:4.43 (3.6%) stddev-sans-first:4.69 05:23:03 INFO - PROCESS | 10695 | Values: 124.0 119.0 121.0 123.0 128.0 131.0 118.0 118.0 122.0 127.0 05:23:03 INFO - PROCESS | 10695 | 05:23:03 INFO - PROCESS | 10695 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:152.40 Median:152.50 stddev:5.87 (3.9%) stddev-sans-first:5.75 05:23:03 INFO - PROCESS | 10695 | Values: 146.0 164.0 160.0 153.0 153.0 148.0 152.0 151.0 152.0 145.0 05:23:03 INFO - PROCESS | 10695 | 05:23:03 INFO - PROCESS | 10695 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:68.70 Median:68.50 stddev:1.42 (2.1%) stddev-sans-first:1.42 05:23:03 INFO - PROCESS | 10695 | Values: 70.0 69.0 68.0 72.0 68.0 68.0 68.0 68.0 69.0 67.0 05:23:03 INFO - PROCESS | 10695 | -------- Summary: end -------- 05:23:03 INFO - PROCESS | 10695 | 05:23:04 INFO - TEST-INFO | 10695: exit 0 05:23:04 INFO - TEST-OK | kraken | took 60117ms 05:23:04 INFO - SUITE-END | took 1172s 05:23:04 INFO - Completed test suite (00:19:32) 05:23:04 INFO - Working with test: dromaeo_css 05:23:04 INFO - Generating results file: dromaeo_css 05:23:04 INFO - Working with test: kraken 05:23:04 INFO - Generating results file: kraken 05:23:04 INFO - javascript benchmark 05:23:04 INFO - Posting result 0 of 2 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 05:23:04 INFO - process_Request line: dromaeo_css graph.html#tests=[[72,64,43]] 05:23:04 INFO - process_Request line: dromaeo_css 6937.03 graph.html#tests=[[72,64,43]] 05:23:04 INFO - Posting result 1 of 2 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 05:23:04 INFO - process_Request line: kraken 1526.80 graph.html#tests=[[232,64,43]] 05:23:04 INFO - RETURN: dromaeo_css: 6937.03 05:23:04 INFO - RETURN: kraken: 1526.80 05:23:04 INFO - javascript benchmark 05:23:05 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"lowerIsBetter": false, "subtests": [{"lowerIsBetter": false, "replicates": [3223.11364374797, 3228.24136327963, 3265.1837040739806, 3271.541984122222, 3287.4411350070486, 5282.498162674539, 5456.045192091388, 5460.972695136519, 5464.863378415542, 5467.835964921053, 5370.7046112463795, 5477.698726570037, 5491.752871120799, 5522.5581953443725, 5536.916946245809, 4900.387451568554, 4972.2044472884345, 5011.0, 5028.698278103326, 5043.268726034741, 4976.3530741003615, 5040.697558146523, 5050.964552266776, 5076.6192535559985, 5078.974605126969, 4860.465348811628, 4900.534449227335, 5012.8997420051755, 5013.373328333958, 5022.8949631081105, 4996.975015124901, 5007.273945277951, 5010.0, 5017.8243761468175, 5070.923936140924, 4809.398825146856, 4908.533689299511, 4947.529984651488, 4950.405951285833, 5013.147764879979, 5242.397124330712, 5287.894242115136, 5314.7608357624, 5320.361556613192, 5344.545713614309, 5862.472377486004, 5894.734736936848, 5897.823065308047, 5903.173555702205, 5908.556858235606, 5789.247397838296, 5888.087346461305, 5893.5579831512805, 5897.64614123154, 5951.49412299955, 5412.621116521845, 5438.510534051954, 5442.319710036246, 5444.428335024805, 5448.0, 6016.368281330485, 6031.487323577545, 6078.209832721806, 6104.725287362079, 6130.386961303834, 5705.657660540381, 5724.627899186623, 5747.48272655463, 5765.798197063083, 5774.931637647049, 5652.180433837153, 5818.2436283282905, 5839.766409343663, 5847.356790753014, 5854.356020837705, 5842.0, 5842.328132264759, 5869.7945571904775, 5881.9705901470215, 5895.233619629421, 5852.209951656472, 5882.676452795137, 5893.882122357614, 5903.144044113579, 5906.3207731110615, 4430.180416622935, 4467.7319360838455, 4493.73037617744, 4499.842505512292, 4546.499885012646, 3956.1296514766705, 3966.2464131814863, 3969.583193764671, 3980.0646847990697, 4000.4599379084034, 5340.2256672783005, 5449.182622606561, 5493.697846618475, 5497.532709719639, 5502.889942201134, 5808.941910580925, 5829.213056237354, 5872.677002764889, 5880.970595146997, 5920.615160014585, 5442.6462279951675, 5562.916556251659, 5576.832695019156, 5582.274304340491, 5587.078132108238, 4901.313816065754, 4939.802407903644, 5005.799768009311, 5010.67430617016, 5071.061853557104, 5933.643981361132, 5976.073708575178, 6024.0662697282, 6028.367021462771, 6057.454829065406, 5815.244018277766, 5854.326752423355, 5860.0, 5860.38465961085, 5875.0, 5892.145638882424, 5965.463108320272, 5978.551608629457, 5990.7903223386975, 5993.850153746192, 5727.31272247333, 5755.7409916553015, 5782.1615865698395, 5818.679972601548, 5932.080527518242, 5919.6744179070565, 5920.763169473173, 5929.199558059607, 5931.6441013539325, 5935.258092738408, 5756.913646295393, 5764.6829424380385, 5777.075667893117, 5784.190213370048, 5785.566082543742, 5620.550355971594, 5700.201971724045, 5751.942480575308, 5782.306123265235, 5828.533717302521, 5646.181303711021, 5659.179418984307, 5682.034054210877, 5689.431056894443, 5690.231818704422, 5559.944400555943, 5770.5095066919785, 5792.102224155263, 5801.071828507418, 5834.504067154339, 5652.0, 5674.375818660027, 5696.088625819849, 5714.571407144397, 5726.169705392778], "unit": "score", "name": "dojo.html", "value": 5398.650700652746}, {"lowerIsBetter": false, "replicates": [534.5616594392598, 568.6161840757487, 592.4164697772693, 600.5015836855409, 611.0955785437556, 36197.0, 36734.26531469372, 36790.63209367906, 36900.0, 37121.25757484849, 37751.811240943825, 38022.61977380225, 38180.23639527208, 38414.423783643266, 38544.421833672444, 8328.708495202683, 8457.830843383128, 8483.787905302386, 8513.95743021284, 8514.872276915852, 8335.66657333706, 8555.315574754004, 8632.611532481022, 8656.740297791077, 8669.089745576719, 8699.739007829776, 8718.912810871905, 8725.912740872605, 8745.0, 8785.253253473431, 8623.611937462829, 8696.739097827107, 8696.913030869673, 8704.0, 8744.781380465476, 8589.31285497165, 8636.17956294151, 8666.480011199348, 8733.03936566977, 8743.475391476468, 36483.0, 36912.63087369119, 37037.07407314839, 37085.258294834224, 37237.0, 3046.6344038715274, 3128.7340576051065, 3387.1870751019824, 3471.756977011585, 3747.9812600937094, 29760.55359169614, 30323.0, 30854.22864428385, 31001.534976975363, 31010.534841977387, 3850.6534411902785, 3862.304785138674, 3870.2453021660785, 3958.2875082485143, 4063.6952228582677, 250698.0, 256255.0, 261460.0, 262272.6886365575, 262378.0, 50206.0, 50908.745456273224, 51061.744691276304, 53807.73096134494, 60573.69713151494, 59835.40164598385, 60413.69793151094, 60455.395446044975, 60589.394106059255, 60709.0, 16004.359825606845, 16090.517284481484, 16215.756763648555, 16221.2700428481, 16268.26792794327, 12067.517299307929, 12083.395830208454, 12118.81821772674, 12138.635840924786, 12279.2018518796, 20694.89652551758, 20726.896365518074, 20749.377518674464, 20917.686234706493, 20946.162153513993, 7806.570638614817, 7954.960225198953, 8020.318272946864, 8056.355491560661, 8087.636056377477, 1039.2361614213698, 1044.3577200021932, 1062.9202809789297, 1093.7375029992904, 1207.3661327802974, 29671.703282966893, 29753.553696694566, 29823.850880745456, 30235.69764302329, 30497.847510762305, 1075.7203127186988, 1088.8911108889206, 1100.3782862682558, 1108.3626914524182, 1132.5752842683994, 14943.701125977419, 15209.239538023276, 15309.617259568377, 15435.768463472832, 15482.148481833383, 343010.0, 349015.0, 350418.0, 351570.0, 352562.0, 54654.72672636611, 55280.44719552834, 55543.16685249725, 55573.16640250399, 55581.44418555844, 1344.5025340623836, 1371.3143428285857, 1375.0512146619, 1378.3177327223088, 1383.266868559665, 28485.0, 28597.0, 29132.0, 29423.85288073546, 29509.0, 41828.0, 41986.580134198266, 42148.57851421447, 42622.0, 42828.357574637026, 217458.0, 217981.0, 220475.0, 268646.0, 270624.0, 31957.20106997344, 42918.78540607277, 43304.56695433131, 43569.128617428105, 43619.56380436155, 42834.78582607067, 43158.35262471128, 43553.56446435622, 43798.0, 44028.119437610425, 36584.634153658124, 36878.0, 37068.44397333988, 37334.813325933195, 37742.0, 37079.814600926824, 39205.80397097996, 40538.0, 42870.35694464648, 44447.11105777931, 36538.8173059133, 37394.06514837151, 37394.43908341431, 37432.0, 37556.0, 30589.694103058686, 33521.66478335283, 33534.66465335315, 33910.66089339174, 33973.49039764455, 27524.311892202055, 28156.571965344665, 30096.0, 30430.391392172474, 30693.846530767205], "unit": "score", "name": "ext.html", "value": 18741.359610996427}, {"lowerIsBetter": false, "replicates": [361.286459242995, 365.1728834190559, 370.22622718518306, 372.281496711347, 377.8696349759332, 13428.798568021488, 15905.852709884162, 16497.67004659906, 16559.83440165598, 17090.0, 15938.20308984549, 16015.19924003801, 16056.0, 16109.355625774984, 16172.0, 4583.19794036044, 4787.066522028206, 4800.111979283826, 4802.783874725646, 4828.951710482886, 4713.622910167179, 4760.190767569521, 5390.9191362129595, 5447.046766815811, 5450.945490545103, 3792.924141517168, 5354.491323324298, 5423.755930983096, 5431.2396264522995, 5488.286522752057, 5345.732713364317, 5421.5391691706445, 5442.074847275972, 5479.1781232815, 5482.23248745176, 5458.5087342139395, 5468.9726551367385, 5478.780848766045, 5484.780608775644, 5492.835214943518, 19070.33253836109, 19193.90403047976, 19509.122089506007, 19540.31608893696, 19590.804091959184, 2049.98975005124, 2131.541718530523, 2201.9889900550393, 2226.0973543919185, 2389.2439057292877, 9325.813483730288, 9585.616575336979, 9617.903820961841, 9706.51467426633, 9895.109440150422, 1823.6443893440785, 1916.037462970912, 1916.2047750183658, 1927.7012063130237, 1939.660559402113, 55517.44482555163, 57018.42981570214, 59512.40487595155, 59666.10500842447, 59715.0, 9659.130678238993, 10018.64934727281, 10158.593656253815, 10248.0, 10294.742631434274, 13265.535706250235, 13360.732785344238, 13369.398377073056, 13374.197548147142, 13383.799243011363, 7671.6164191790185, 7680.923190768132, 7720.9613951931005, 7726.266004729542, 7762.068551773823, 7550.169481357047, 7552.244775522514, 7588.165301816795, 7636.618169091523, 7641.044869391326, 4406.0, 4411.551588868145, 4424.446944131983, 4435.401220835211, 4473.507914129443, 1806.4490330449075, 1849.833514983658, 1899.2877670873422, 1908.59919416924, 1913.550315675815, 433.57726216938863, 448.7487007275936, 454.3820404250217, 468.3583490617807, 494.2857570810145, 10403.739906502398, 11027.062699670618, 11122.110231181487, 11172.720681982853, 11313.377764222882, 451.54845154845157, 468.5104066250776, 471.24130150457734, 483.16894940701934, 484.4670862051715, 6029.155918171459, 6144.56988010835, 6175.042868355412, 6201.844953876189, 6243.157173781572, 478567.0, 482392.0, 486786.0, 490517.0, 503873.0, 42966.785166074595, 56711.71644141753, 67156.6642166786, 68199.65900170467, 69661.65169174122, 508.90839648862817, 512.779504812934, 514.390447319927, 518.289942778396, 518.3365292425701, 10145.594176233164, 10327.586896524055, 10428.165746740091, 10493.737656558647, 10513.526891290063, 30365.69634303629, 31309.0, 31651.0, 31899.0, 31996.5200521997, 45919.77040114778, 46282.53717462917, 46347.768261158475, 46369.76815115903, 46575.30137048015, 7330.193678695446, 7350.154732205865, 7365.594892280976, 7584.8483030340185, 7649.732259371118, 9086.591103400495, 11505.539778409106, 11571.305721656727, 11917.344546049704, 12337.691557711129, 9837.9016209837, 9882.703518894445, 10294.404367322777, 10424.426656533964, 10466.738331541772, 10133.543990520591, 10203.132733717717, 10225.48872556384, 10238.897611023795, 10622.8937710625, 8513.339898719938, 9833.950830245803, 10225.693229203136, 10303.742406439898, 10748.838767418338, 7679.424043196671, 7766.88349674744, 7916.683332666629, 7975.72084977023, 7997.840043198987, 9199.218066464158, 10785.552033149197, 10844.783104337712, 10869.076128529163, 11030.669079927615], "unit": "score", "name": "jquery.html", "value": 7458.859058649448}, {"lowerIsBetter": false, "replicates": [1465.6189390758402, 1504.3080183115762, 1658.3698194686017, 1790.9194086266116, 1792.2024699008946, 6941.340572645603, 7908.644111015004, 7996.760097197086, 8198.057223419308, 8239.711610093655, 7945.404094692893, 8011.59942002899, 8021.478603890743, 8107.067687215972, 8120.147384524628, 2363.763623637631, 2365.95268094638, 2382.249591378719, 2382.368672301846, 2387.7612238776155, 2274.317704688595, 2285.942851428711, 2333.708286464192, 2338.567365037465, 2345.4019225097577, 2304.493011537459, 2304.6312589985605, 2312.0867257433306, 2338.777816107467, 2341.54339903718, 2399.5200959808108, 2406.0496104038807, 2429.0648100481353, 2434.85390876548, 2440.707115146185, 2348.471593891378, 2364.8935797889135, 2369.099742098009, 2378.3340664613934, 2385.0340612052146, 8163.469374490639, 8178.386621003389, 8194.0, 8239.464434811718, 8268.958655206745, 4989.376327959005, 5104.387473503166, 5129.538341549279, 5137.51193636604, 5138.922916156261, 3257.7068063874126, 3279.950800737991, 3284.6222684391364, 3310.2717402171725, 3358.395488812013, 1024.467277015955, 1034.7775228325945, 1052.0105696820685, 1053.4522048534795, 1120.1542835159403, 11408.71478213043, 11428.771424571461, 11472.139589530736, 11508.424578771028, 11550.36472993985, 4571.22289210835, 4679.321498382716, 4682.1338052460405, 4696.647751418657, 4724.244120940633, 9824.607015719292, 9856.112949834549, 9864.654737084167, 9888.802223955625, 9911.702648920544, 5133.614978876599, 5133.8716532087, 5136.409312928986, 5137.049645815461, 5162.819301324435, 4036.1524079942956, 4551.47658019332, 4578.923952871072, 4590.829338518656, 4677.742724150205, 3840.0591854995705, 3857.228554289153, 3884.825182866721, 3906.7069969752383, 3952.881413557598, 1254.1597129922973, 1268.4418855703461, 1273.5669872243482, 1281.1608396500308, 1295.2875918244927, 1069.005824583145, 1070.7590792071878, 1222.96048358896, 1365.549368708324, 1374.2098293481288, 7638.656260468292, 7672.462927595015, 7754.612269386508, 7920.6039698014865, 7927.722529711433, 481.1507688929043, 487.60016786234945, 529.6610169491529, 531.452603818068, 538.329779424611, 6020.277566691937, 6022.307434645072, 6101.084837274356, 6105.145279660851, 6126.295476020226, 9355.766105847408, 9562.856557151648, 9567.330286879991, 9635.662751803653, 9654.03459654043, 9282.535873206447, 9433.575489103006, 9481.24150067993, 9544.52277386128, 9567.282453815991, 7523.0, 7532.962335188289, 7555.886661700079, 7587.279208475186, 7597.544147351176, 7591.089069311718, 7619.428542859197, 7702.075750909927, 7740.7677769667, 7772.106207786177, 8755.737327880173, 8868.911310886808, 8947.507887066275, 8972.41679290844, 9077.137671921157, 9075.682351117679, 9184.357095003286, 9275.118863708207, 9280.767980800534, 9310.394824336396, 6311.90532142009, 6929.965350173418, 7105.147382314155, 7300.0, 7398.0, 7738.380929525511, 7766.495177813424, 7770.689172433265, 7786.416018798726, 7814.648340824563, 7099.893501597377, 7214.134303883568, 7292.270772922665, 7426.2945020223, 7444.888326675213, 7132.964335178291, 7149.571025738473, 7162.212156662658, 7194.712211511481, 7274.6726397313305, 7369.410447164107, 7373.889391659237, 7446.069241344832, 7450.925490745023, 7471.215522370073, 6742.157230346207, 6753.223379311442, 6771.119754431892, 6803.421709154777, 6823.727050917908, 6607.141071660653, 6715.395614394728, 6728.05807187004, 6756.223034351113, 6772.966135169293], "unit": "score", "name": "mootools.html", "value": 4617.995052169219}, {"lowerIsBetter": false, "replicates": [340.4688685650386, 345.48350216426445, 347.95128681984545, 349.83557727867907, 351.01890216843935, 6190.133381326618, 6202.131701561785, 6220.84447888803, 6332.430081292689, 6353.682315884211, 6197.783077592285, 6242.812715618538, 6261.436470717635, 6268.623882567049, 6273.654948977815, 4810.302506136608, 4812.759362031902, 4814.542618451259, 4815.735134567615, 4825.7587120644, 4818.807247710088, 4820.590249828769, 4825.541573550507, 4829.420469543659, 4844.370231869852, 4700.976495117537, 4776.785044672981, 4783.71297722136, 4802.83190088347, 4816.494268101851, 4757.429108506966, 4759.643026772988, 4769.403824521934, 4785.59322457588, 4815.927761083586, 4184.686148538872, 4185.058361868586, 4190.748555086705, 4193.077522944947, 4203.159368126387, 5970.223870896799, 5978.910316345258, 6013.639181649115, 6024.277086749575, 6024.939750602482, 5464.9453505464835, 5598.664080155204, 5605.7197140142825, 5606.55147588192, 5607.607467477278, 6688.0, 6705.932940670579, 6733.124693789825, 6757.324267573253, 6764.9323506764795, 4657.604103651193, 4659.836905708284, 4668.883277918079, 4670.486246512881, 4677.228257337535, 6693.698783554752, 6865.656717164122, 6952.93047069533, 7065.0815393998455, 7084.43324534036, 4703.153432382135, 4742.359781429532, 4784.497627749106, 4799.256115302133, 4800.35195248644, 4840.7337596432535, 4841.15279826029, 4895.066448752723, 4910.214365701542, 4921.7785199666105, 5622.85942851432, 5636.210930469738, 5637.887242255214, 5642.181883626933, 5654.830355089354, 6560.606363618198, 6744.123263975652, 6744.6627668616375, 6752.93247067523, 6764.391204791593, 1653.8346165383366, 1686.8228835972045, 1691.2389424758908, 1695.9491215263563, 1708.5643160994116, 1149.4827327702567, 1165.5862168930078, 1171.0572988744143, 1176.0650283025016, 1176.5235079792697, 6213.0, 6263.185785847902, 6264.404881536247, 6278.434940855345, 6288.685565721696, 6838.316168383221, 6840.794776156723, 6842.6578671066245, 6849.623270720059, 6852.862942741117, 6192.752289908443, 6210.689465526705, 6275.058741188767, 6277.748890044439, 6281.560290779602, 3710.07248187953, 3742.7941463219786, 3744.737868349244, 3759.4172903200047, 3765.9623403765613, 7277.345038946521, 7291.270872912773, 7299.598522081336, 7328.534293141393, 7345.19202887682, 7000.719971201095, 7106.751263705745, 7128.180259270147, 7174.964125179341, 7190.892136617955, 7286.0, 7311.415086793044, 7320.597367144752, 7324.047873776375, 7325.047743793273, 6919.827004324932, 6970.128733908262, 6972.51192416526, 6975.755848545276, 6978.057962175041, 6738.898916516354, 6853.657317134223, 6873.072135261876, 6888.483363747639, 6896.0, 7269.818254543678, 7277.890831637424, 7291.8541629168185, 7293.744718934812, 7307.926920730724, 4663.556962088596, 4701.271302948048, 4709.976450117728, 4711.929321060118, 4723.84265854854, 6683.0, 6831.077804496329, 6852.828679283058, 6994.125734283215, 7023.894641580483, 6813.89779153323, 6825.624590647562, 6829.726810927706, 6832.111825462658, 6853.623050732258, 6754.86490270182, 6770.1537307836525, 6771.45828333742, 6786.151731033621, 6797.762078327432, 6521.608703477807, 6534.575252608565, 6662.933370666231, 6664.8000559983275, 6671.733130674913, 6828.829279268058, 6842.24735279109, 6850.246472887879, 6860.279670634512, 6872.140982377203, 6602.3397660233595, 6663.733450662113, 6671.799846004627, 6674.566153200027, 6680.665966701548], "unit": "score", "name": "prototype.html", "value": 5063.495489583679}, {"lowerIsBetter": false, "replicates": [634.771482266384, 656.1142457682126, 746.537146968879, 746.7423738810111, 820.1757233979849, 13204.405801738922, 13342.266175360352, 13396.866031339683, 13481.258530780804, 13526.864731352684, 12740.362981850894, 12772.361381930912, 12777.808332875014, 12785.424655890483, 12847.357632118381, 659.6899457255082, 779.2246714519061, 803.8151225218203, 807.870740681491, 808.5512540539997, 813.9715109971153, 817.2971244729528, 817.668844118133, 820.4011071917504, 821.1993306526119, 852.1010334097525, 852.1819053708448, 854.8033952191, 855.5465603230298, 859.1923591823665, 838.1534650003509, 844.2823599940064, 850.6852464588111, 851.8764779107057, 852.0499642898186, 621.9036049412304, 622.9439350458481, 623.5136593457111, 625.871696302257, 625.9061140828867, 13039.217646941213, 13094.934525327408, 13099.148555343872, 13104.344782760823, 13141.540046098437, 12706.364681765876, 12993.545225917142, 13110.737785244242, 13352.86647133526, 13359.398827052708, 10444.582216711322, 10492.475376231157, 10592.632034675147, 10751.892481075167, 10910.0, 3613.9457908131135, 3630.364686179908, 3682.834272457719, 3695.57500887396, 3736.290104880064, 44944.3258351125, 45074.77462612666, 45243.77378113088, 45335.0, 45405.318920216225, 9896.505174741378, 10129.694998611933, 10176.847347289797, 10186.949065254626, 10560.366378017343, 17907.641847163246, 17925.28298868031, 17931.910340448216, 17937.282508699765, 18054.819451805575, 7629.237076292437, 8036.437449378487, 8039.557824319719, 8043.839123217503, 8131.064927533409, 4144.564820693844, 4375.431193944767, 4433.046894917544, 4443.422355093817, 4478.865634030984, 3029.8636561354792, 3047.9847600761855, 3050.8016978896744, 3055.511118221074, 3086.8147911125407, 565.2736233939369, 572.3601880612017, 581.6364772017489, 587.7678317064821, 590.8168467775004, 678.1184460201816, 711.0652074602244, 714.4067036656902, 722.703691486488, 727.287258486686, 8609.956950215208, 9057.81884362309, 9208.171264586219, 9343.486108264111, 9674.951625241829, 701.8701540215077, 728.9854202915913, 732.5421611492817, 735.63586024918, 741.23282402714, 4021.597840215955, 4184.4351012613515, 4192.203481338597, 4227.936580951288, 4250.85122020734, 53199.0, 53247.467525325024, 53448.73275633597, 53852.192217116775, 55347.16979245315, 47664.76167619209, 48240.0, 48939.0, 49367.0, 50019.499805001484, 39576.2508498982, 40703.18593628111, 41510.584894151274, 41844.16311673688, 42149.36775948363, 8958.415841584158, 9025.277977761632, 9114.954425228098, 9161.175494205554, 9251.398659087137, 32479.0, 32958.34083318368, 33740.49389259212, 33743.98768036963, 33875.0, 40691.0, 41304.79347603243, 41891.581084188765, 43816.0, 43948.56051439445, 11489.82765258505, 11494.137939654727, 11558.0, 11577.536898523964, 11578.36319002463, 11166.888331116585, 11465.0, 11583.594574189863, 11673.824892626448, 12006.699832504257, 11373.974534691843, 11502.367369794407, 11689.88310116922, 11881.405929703307, 12276.140670153361, 11046.122159233111, 11250.099992000783, 11444.084473241954, 11671.59149429766, 11734.530618775154, 11076.446177690923, 11252.774944501229, 11519.424028798694, 11766.647000589996, 12133.939330303292, 9387.249020078514, 9522.666706665234, 9527.952360238154, 9564.0, 9748.805023899624, 9619.56711947978, 9784.706458806248, 9786.902130978599, 9802.166815820736, 9880.160186384237], "unit": "score", "name": "yui.html", "value": 6314.575213962605}], "name": "dromaeo_css", "value": 6937.030298972958}, {"lowerIsBetter": true, "subtests": [{"lowerIsBetter": true, "replicates": [111.0, 106.0, 113.0, 110.0, 110.0, 124.0, 111.0, 112.0, 112.0, 110.0], "unit": "score", "name": "ai-astar", "value": 111.9}, {"lowerIsBetter": true, "replicates": [158.0, 134.0, 152.0, 159.0, 128.0, 159.0, 146.0, 126.0, 160.0, 127.0], "unit": "score", "name": "audio-beat-detection", "value": 144.9}, {"lowerIsBetter": true, "replicates": [163.0, 163.0, 162.0, 161.0, 162.0, 163.0, 163.0, 165.0, 171.0, 164.0], "unit": "score", "name": "audio-dft", "value": 163.7}, {"lowerIsBetter": true, "replicates": [73.0, 74.0, 75.0, 74.0, 73.0, 147.0, 73.0, 72.0, 72.0, 74.0], "unit": "score", "name": "audio-fft", "value": 80.7}, {"lowerIsBetter": true, "replicates": [95.0, 95.0, 152.0, 95.0, 96.0, 96.0, 135.0, 96.0, 104.0, 145.0], "unit": "score", "name": "audio-oscillator", "value": 110.9}, {"lowerIsBetter": true, "replicates": [120.0, 115.0, 116.0, 115.0, 115.0, 115.0, 116.0, 116.0, 115.0, 116.0], "unit": "score", "name": "imaging-gaussian-blur", "value": 115.9}, {"lowerIsBetter": true, "replicates": [146.0, 147.0, 147.0, 147.0, 146.0, 147.0, 147.0, 147.0, 147.0, 146.0], "unit": "score", "name": "imaging-darkroom", "value": 146.7}, {"lowerIsBetter": true, "replicates": [97.0, 97.0, 97.0, 97.0, 97.0, 97.0, 97.0, 97.0, 96.0, 96.0], "unit": "score", "name": "imaging-desaturate", "value": 96.8}, {"lowerIsBetter": true, "replicates": [58.0, 57.0, 58.0, 61.0, 57.0, 59.0, 57.0, 60.0, 55.0, 55.0], "unit": "score", "name": "json-parse-financial", "value": 57.7}, {"lowerIsBetter": true, "replicates": [67.0, 67.0, 67.0, 67.0, 68.0, 67.0, 67.0, 67.0, 67.0, 67.0], "unit": "score", "name": "json-stringify-tinderbox", "value": 67.1}, {"lowerIsBetter": true, "replicates": [91.0, 93.0, 86.0, 85.0, 85.0, 84.0, 87.0, 84.0, 84.0, 84.0], "unit": "score", "name": "stanford-crypto-aes", "value": 86.3}, {"lowerIsBetter": true, "replicates": [124.0, 119.0, 121.0, 123.0, 128.0, 131.0, 118.0, 118.0, 122.0, 127.0], "unit": "score", "name": "stanford-crypto-ccm", "value": 123.1}, {"lowerIsBetter": true, "replicates": [146.0, 164.0, 160.0, 153.0, 153.0, 148.0, 152.0, 151.0, 152.0, 145.0], "unit": "score", "name": "stanford-crypto-pbkdf2", "value": 152.4}, {"lowerIsBetter": true, "replicates": [70.0, 69.0, 68.0, 72.0, 68.0, 68.0, 68.0, 68.0, 69.0, 67.0], "unit": "score", "name": "stanford-crypto-sha256-iterative", "value": 68.7}], "name": "kraken", "value": 1526.8}]} 05:23:05 INFO - TinderboxPrint: TalosResult: {"graphserver": {"kraken": {"url": "http://graphs.mozilla.org/graph.html#tests=[[232,64,43]]", "result": "1526.80"}, "dromaeo_css": {"url": "http://graphs.mozilla.org/graph.html#tests=[[72,64,43]]", "result": "6937.03"}}} 05:23:05 INFO - Return code: 0 05:23:05 INFO - Validating PERFHERDER_DATA against /builds/slave/test-pgo/build/tests/talos/treeherder-schemas/performance-artifact.json 05:23:05 INFO - # TBPL SUCCESS # 05:23:05 INFO - Running post-action listener: _resource_record_post_action 05:23:05 INFO - Running post-run listener: _resource_record_post_run 05:23:06 INFO - Total resource usage - Wall time: 1190s; CPU: 13.0%; Read bytes: 4096; Write bytes: 538824704; Read time: 20; Write time: 976924 05:23:06 INFO - install - Wall time: 16s; CPU: 17.0%; Read bytes: 0; Write bytes: 240128000; Read time: 0; Write time: 648580 05:23:06 INFO - run-tests - Wall time: 1174s; CPU: 13.0%; Read bytes: 4096; Write bytes: 298696704; Read time: 20; Write time: 328344 05:23:06 INFO - Running post-run listener: _upload_blobber_files 05:23:06 INFO - Blob upload gear active. 05:23:06 INFO - Preparing to upload files from /builds/slave/test-pgo/build/blobber_upload_dir. 05:23:06 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 05:23:06 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', 'Fx-Team', '-d', '/builds/slave/test-pgo/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test-pgo/build/uploaded_files.json'] 05:23:06 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 Fx-Team -d /builds/slave/test-pgo/build/blobber_upload_dir --output-manifest /builds/slave/test-pgo/build/uploaded_files.json 05:23:06 INFO - (blobuploader) - INFO - Open directory for files ... 05:23:06 INFO - (blobuploader) - INFO - Uploading /builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs-e10s_raw.log ... 05:23:06 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 05:23:06 INFO - (blobuploader) - INFO - Uploading, attempt #1. 05:23:07 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_raw.log: uploaded 05:23:07 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 05:23:07 INFO - (blobuploader) - INFO - Done attempting. 05:23:07 INFO - (blobuploader) - INFO - Uploading /builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log ... 05:23:07 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 05:23:07 INFO - (blobuploader) - INFO - Uploading, attempt #1. 05:23:08 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_errorsummary.log: uploaded 05:23:08 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 05:23:08 INFO - (blobuploader) - INFO - Done attempting. 05:23:08 INFO - (blobuploader) - INFO - Iteration through files over. 05:23:08 INFO - Return code: 0 05:23:08 INFO - rmtree: /builds/slave/test-pgo/build/uploaded_files.json 05:23:08 INFO - retry: Calling remove with args: ('/builds/slave/test-pgo/build/uploaded_files.json',), kwargs: {}, attempt #1 05:23:08 INFO - Setting buildbot property blobber_files to {"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/45d9a7e0ecaf78477d9f5e55ea4648f549c1babace8e29ebfcc388ec588bc44d80cd9a5bf1c3624ba643fca901657909946d5a552915282371ba5dee8671c5f4", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/9d70b4e9710c8bb2ad3db11d5322aba17082ec68fd2d4431b64a35019c828083d390101417bf9b759a1826679f7032bb735418aa25e24f2e168bd3605acc6da8"} 05:23:08 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test-pgo/properties/blobber_files 05:23:08 INFO - Writing to file /builds/slave/test-pgo/properties/blobber_files 05:23:08 INFO - Contents: 05:23:08 INFO - blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/45d9a7e0ecaf78477d9f5e55ea4648f549c1babace8e29ebfcc388ec588bc44d80cd9a5bf1c3624ba643fca901657909946d5a552915282371ba5dee8671c5f4", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/9d70b4e9710c8bb2ad3db11d5322aba17082ec68fd2d4431b64a35019c828083d390101417bf9b759a1826679f7032bb735418aa25e24f2e168bd3605acc6da8"} 05:23:08 INFO - Running post-run listener: copy_logs_to_upload_dir 05:23:08 INFO - Copying logs to upload dir... 05:23:08 INFO - mkdir: /builds/slave/test-pgo/build/upload/logs 05:23:08 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1243.792581 ========= master_lag: 0.02 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 43 secs) (at 2016-02-11 05:23:08.210567) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-02-11 05:23:08.214182) ========= 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=aa52b8aba932b19cc50b5275000001de-1455194244.947672-544072490 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/45d9a7e0ecaf78477d9f5e55ea4648f549c1babace8e29ebfcc388ec588bc44d80cd9a5bf1c3624ba643fca901657909946d5a552915282371ba5dee8671c5f4", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/9d70b4e9710c8bb2ad3db11d5322aba17082ec68fd2d4431b64a35019c828083d390101417bf9b759a1826679f7032bb735418aa25e24f2e168bd3605acc6da8"} build_url:https://queue.taskcluster.net/v1/task/ZeyrmPOISB-v8xwwirjieA/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.011412 build_url: 'https://queue.taskcluster.net/v1/task/ZeyrmPOISB-v8xwwirjieA/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2' blobber_files: '{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/45d9a7e0ecaf78477d9f5e55ea4648f549c1babace8e29ebfcc388ec588bc44d80cd9a5bf1c3624ba643fca901657909946d5a552915282371ba5dee8671c5f4", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/9d70b4e9710c8bb2ad3db11d5322aba17082ec68fd2d4431b64a35019c828083d390101417bf9b759a1826679f7032bb735418aa25e24f2e168bd3605acc6da8"}' ========= master_lag: 0.02 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-02-11 05:23:08.241614) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-02-11 05:23:08.242150) ========= 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=aa52b8aba932b19cc50b5275000001de-1455194244.947672-544072490 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004492 ========= master_lag: 0.07 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-02-11 05:23:08.321478) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-02-11 05:23:08.321855) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-02-11 05:23:08.322158) ========= ========= Total master_lag: 0.28 =========