builder: fx-team_ubuntu64_hw_test-dromaeojs-pgo slave: talos-linux64-ix-007 starttime: 1455541584.33 results: success (0) buildid: 20160215023002 builduid: fac207381bc248c09eabd981106deba4 revision: 288bdc6d7788efc3f4476f11abe9c67fb8eadfe5 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-02-15 05:06:24.334593) ========= master: http://buildbot-master104.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-02-15 05:06:24.335023) ========= ========= Started set props: basedir (results: 0, elapsed: 0 secs) (at 2016-02-15 05:06:24.335315) ========= 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=b5f16d05e5ea93ddf675e67e000001bf-1455541515.16601-1802459910 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False /builds/slave/test-pgo program finished with exit code 0 elapsedTime=0.006366 basedir: '/builds/slave/test-pgo' ========= master_lag: 0.04 ========= ========= Finished set props: basedir (results: 0, elapsed: 0 secs) (at 2016-02-15 05:06:24.379771) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-02-15 05:06:24.380068) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-02-15 05:06:24.396241) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-02-15 05:06:24.396540) ========= 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=b5f16d05e5ea93ddf675e67e000001bf-1455541515.16601-1802459910 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004526 ========= master_lag: 0.04 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-02-15 05:06:24.444874) ========= ========= Started set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2016-02-15 05:06:24.445164) ========= script_repo_url: https://hg.mozilla.org/build/mozharness ========= Finished set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2016-02-15 05:06:24.448574) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-02-15 05:06:24.448854) ========= 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=b5f16d05e5ea93ddf675e67e000001bf-1455541515.16601-1802459910 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2016-02-15 05:06:25-- 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% 122K=0.1s 2016-02-15 05:06:25 (122 KB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.417125 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-02-15 05:06:24.878159) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-02-15 05:06:24.878477) ========= 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=b5f16d05e5ea93ddf675e67e000001bf-1455541515.16601-1802459910 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.014771 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-02-15 05:06:24.927967) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-02-15 05:06:24.928317) ========= bash -c 'python archiver_client.py mozharness --repo integration/fx-team --rev 288bdc6d7788efc3f4476f11abe9c67fb8eadfe5 --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 288bdc6d7788efc3f4476f11abe9c67fb8eadfe5 --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=b5f16d05e5ea93ddf675e67e000001bf-1455541515.16601-1802459910 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2016-02-15 05:06:25,739 truncating revision to first 12 chars 2016-02-15 05:06:25,739 Setting DEBUG logging. 2016-02-15 05:06:25,739 attempt 1/10 2016-02-15 05:06:25,739 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/integration/fx-team/288bdc6d7788?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-02-15 05:06:26,142 unpacking tar archive at: fx-team-288bdc6d7788/testing/mozharness/ program finished with exit code 0 elapsedTime=0.695098 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-02-15 05:06:25.636588) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-02-15 05:06:25.637007) ========= echo 288bdc6d7788efc3f4476f11abe9c67fb8eadfe5 in dir /builds/slave/test-pgo/. (timeout 1200 secs) watching logfiles {} argv: ['echo', u'288bdc6d7788efc3f4476f11abe9c67fb8eadfe5'] 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=b5f16d05e5ea93ddf675e67e000001bf-1455541515.16601-1802459910 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 288bdc6d7788efc3f4476f11abe9c67fb8eadfe5 program finished with exit code 0 elapsedTime=0.003824 script_repo_revision: '288bdc6d7788efc3f4476f11abe9c67fb8eadfe5' ========= master_lag: 0.05 ========= ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-02-15 05:06:25.689344) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-02-15 05:06:25.689711) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-02-15 05:06:25.700494) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 28 secs) (at 2016-02-15 05:06:25.701019) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs --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', '--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=b5f16d05e5ea93ddf675e67e000001bf-1455541515.16601-1802459910 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 05:06:26 INFO - MultiFileLogger online at 20160215 05:06:26 in /builds/slave/test-pgo 05:06:26 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs --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:06:26 INFO - Dumping config to /builds/slave/test-pgo/logs/localconfig.json. 05:06:26 INFO - {'append_to_log': False, 05:06:26 INFO - 'base_work_dir': '/builds/slave/test-pgo', 05:06:26 INFO - 'blob_upload_branch': 'Fx-Team', 05:06:26 INFO - 'blob_uploader_auth_file': '/builds/slave/test-pgo/oauth.txt', 05:06:26 INFO - 'branch': 'Fx-Team', 05:06:26 INFO - 'buildbot_json_path': 'buildprops.json', 05:06:26 INFO - 'config_files': ('talos/linux_config.py',), 05:06:26 INFO - 'default_actions': ('clobber', 05:06:26 INFO - 'read-buildbot-config', 05:06:26 INFO - 'download-and-extract', 05:06:26 INFO - 'populate-webroot', 05:06:26 INFO - 'create-virtualenv', 05:06:26 INFO - 'install', 05:06:26 INFO - 'run-tests'), 05:06:26 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 05:06:26 INFO - 'download_minidump_stackwalk': True, 05:06:26 INFO - 'download_symbols': 'ondemand', 05:06:26 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 05:06:26 INFO - 'tooltool.py': '/tools/tooltool.py', 05:06:26 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 05:06:26 INFO - '/tools/misc-python/virtualenv.py')}, 05:06:26 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 05:06:26 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 05:06:26 INFO - 'installer_path': 'installer.exe', 05:06:26 INFO - 'log_level': 'info', 05:06:26 INFO - 'log_name': 'talos', 05:06:26 INFO - 'log_to_console': True, 05:06:26 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 05:06:26 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 05:06:26 INFO - 'opt_config_files': (), 05:06:26 INFO - 'pip_index': False, 05:06:26 INFO - 'sps_profile': False, 05:06:26 INFO - 'sps_profile_interval': 0, 05:06:26 INFO - 'suite': 'dromaeojs', 05:06:26 INFO - 'system_bits': '32', 05:06:26 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 05:06:26 INFO - 'title': 'talos-linux64-ix-007', 05:06:26 INFO - 'tooltool_cache': '/builds/tooltool_cache', 05:06:26 INFO - 'use_talos_json': True, 05:06:26 INFO - 'virtualenv_path': '/builds/slave/test-pgo/build/venv', 05:06:26 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 05:06:26 INFO - 'work_dir': 'build'} 05:06:26 INFO - ##### 05:06:26 INFO - ##### Running clobber step. 05:06:26 INFO - ##### 05:06:26 INFO - Running pre-action listener: _resource_record_pre_action 05:06:26 INFO - Running main action method: clobber 05:06:26 INFO - rmtree: /builds/slave/test-pgo/build 05:06:26 INFO - retry: Calling rmtree with args: ('/builds/slave/test-pgo/build',), kwargs: {}, attempt #1 05:06:27 INFO - Running post-action listener: _resource_record_post_action 05:06:27 INFO - ##### 05:06:27 INFO - ##### Running read-buildbot-config step. 05:06:27 INFO - ##### 05:06:27 INFO - Running pre-action listener: _resource_record_pre_action 05:06:27 INFO - Running main action method: read_buildbot_config 05:06:27 INFO - Using buildbot properties: 05:06:27 INFO - { 05:06:27 INFO - "project": "", 05:06:27 INFO - "product": "firefox", 05:06:27 INFO - "script_repo_revision": "production", 05:06:27 INFO - "builddir": "fx-team_ubuntu64_hw_test-dromaeojs", 05:06:27 INFO - "repository": "", 05:06:27 INFO - "buildername": "Ubuntu HW 12.04 x64 fx-team pgo talos dromaeojs", 05:06:27 INFO - "buildid": "20160215023002", 05:06:27 INFO - "pgo_build": "True", 05:06:27 INFO - "basedir": "/builds/slave/test-pgo", 05:06:27 INFO - "buildnumber": 643, 05:06:27 INFO - "slavename": "talos-linux64-ix-007", 05:06:27 INFO - "master": "http://buildbot-master104.bb.releng.scl3.mozilla.com:8201/", 05:06:27 INFO - "platform": "ubuntu64_hw", 05:06:27 INFO - "scheduler": "tests-fx-team-linux64-pgo-talos", 05:06:27 INFO - "branch": "fx-team", 05:06:27 INFO - "repo_path": "integration/fx-team", 05:06:27 INFO - "revision": "288bdc6d7788efc3f4476f11abe9c67fb8eadfe5", 05:06:27 INFO - "stage_platform": "linux64-pgo", 05:06:27 INFO - "builduid": "fac207381bc248c09eabd981106deba4", 05:06:27 INFO - "slavebuilddir": "test" 05:06:27 INFO - } 05:06:27 INFO - Found installer url https://queue.taskcluster.net/v1/task/Xgllv7XYTiun4XdBZpV-RA/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2. 05:06:27 INFO - Running post-action listener: _resource_record_post_action 05:06:27 INFO - ##### 05:06:27 INFO - ##### Running download-and-extract step. 05:06:27 INFO - ##### 05:06:27 INFO - Running pre-action listener: _resource_record_pre_action 05:06:27 INFO - Running main action method: download_and_extract 05:06:27 INFO - mkdir: /builds/slave/test-pgo/build/tests 05:06:27 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://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:06:27 INFO - https://queue.taskcluster.net/v1/task/Xgllv7XYTiun4XdBZpV-RA/artifacts/public/build/test_packages.json matches https://queue.taskcluster.net 05:06:27 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Xgllv7XYTiun4XdBZpV-RA/artifacts/public/build/test_packages.json 05:06:27 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Xgllv7XYTiun4XdBZpV-RA/artifacts/public/build/test_packages.json 05:06:27 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Xgllv7XYTiun4XdBZpV-RA/artifacts/public/build/test_packages.json to /builds/slave/test-pgo/build/test_packages.json 05:06:27 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Xgllv7XYTiun4XdBZpV-RA/artifacts/public/build/test_packages.json', 'file_name': '/builds/slave/test-pgo/build/test_packages.json'}, attempt #1 05:06:28 INFO - Downloaded 1448 bytes. 05:06:28 INFO - Reading from file /builds/slave/test-pgo/build/test_packages.json 05:06:28 INFO - Using the following test package requirements: 05:06:28 INFO - {u'common': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip'], 05:06:28 INFO - u'cppunittest': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 05:06:28 INFO - u'firefox-47.0a1.en-US.linux-x86_64.cppunittest.tests.zip'], 05:06:28 INFO - u'gtest': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 05:06:28 INFO - u'firefox-47.0a1.en-US.linux-x86_64.gtest.tests.zip'], 05:06:28 INFO - u'jittest': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 05:06:28 INFO - u'jsshell-linux-x86_64.zip'], 05:06:28 INFO - u'mochitest': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 05:06:28 INFO - u'firefox-47.0a1.en-US.linux-x86_64.mochitest.tests.zip'], 05:06:28 INFO - u'mozbase': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip'], 05:06:28 INFO - u'reftest': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 05:06:28 INFO - u'firefox-47.0a1.en-US.linux-x86_64.reftest.tests.zip'], 05:06:28 INFO - u'talos': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 05:06:28 INFO - u'firefox-47.0a1.en-US.linux-x86_64.talos.tests.zip'], 05:06:28 INFO - u'web-platform': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 05:06:28 INFO - u'firefox-47.0a1.en-US.linux-x86_64.web-platform.tests.zip'], 05:06:28 INFO - u'webapprt': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip'], 05:06:28 INFO - u'xpcshell': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 05:06:28 INFO - u'firefox-47.0a1.en-US.linux-x86_64.xpcshell.tests.zip']} 05:06:28 INFO - Downloading packages: [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 05:06:28 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:06:28 INFO - https://queue.taskcluster.net/v1/task/Xgllv7XYTiun4XdBZpV-RA/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 05:06:28 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Xgllv7XYTiun4XdBZpV-RA/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip 05:06:28 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Xgllv7XYTiun4XdBZpV-RA/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip 05:06:28 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Xgllv7XYTiun4XdBZpV-RA/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:06:28 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Xgllv7XYTiun4XdBZpV-RA/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:06:29 INFO - Downloaded 23295988 bytes. 05:06:29 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:06:29 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:06:30 INFO - Return code: 0 05:06:30 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:06:30 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://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:06:30 INFO - https://queue.taskcluster.net/v1/task/Xgllv7XYTiun4XdBZpV-RA/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 05:06:30 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Xgllv7XYTiun4XdBZpV-RA/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip 05:06:30 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Xgllv7XYTiun4XdBZpV-RA/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip 05:06:30 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Xgllv7XYTiun4XdBZpV-RA/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:06:30 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Xgllv7XYTiun4XdBZpV-RA/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:06:31 INFO - Downloaded 23295988 bytes. 05:06:31 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:06:31 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:06:32 INFO - Return code: 0 05:06:32 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://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:06:32 INFO - https://queue.taskcluster.net/v1/task/Xgllv7XYTiun4XdBZpV-RA/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.talos.tests.zip matches https://queue.taskcluster.net 05:06:32 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Xgllv7XYTiun4XdBZpV-RA/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.talos.tests.zip 05:06:32 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Xgllv7XYTiun4XdBZpV-RA/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.talos.tests.zip 05:06:32 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Xgllv7XYTiun4XdBZpV-RA/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:06:32 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Xgllv7XYTiun4XdBZpV-RA/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:06:33 INFO - Downloaded 10707070 bytes. 05:06:33 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:06:33 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:06:34 INFO - Return code: 0 05:06:34 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://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:06:34 INFO - https://queue.taskcluster.net/v1/task/Xgllv7XYTiun4XdBZpV-RA/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2 matches https://queue.taskcluster.net 05:06:34 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Xgllv7XYTiun4XdBZpV-RA/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2 05:06:34 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Xgllv7XYTiun4XdBZpV-RA/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2 05:06:34 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Xgllv7XYTiun4XdBZpV-RA/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:06:34 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Xgllv7XYTiun4XdBZpV-RA/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:06:35 INFO - Downloaded 56528618 bytes. 05:06:35 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/Xgllv7XYTiun4XdBZpV-RA/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2 05:06:35 INFO - mkdir: /builds/slave/test-pgo/properties 05:06:35 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test-pgo/properties/build_url 05:06:35 INFO - Writing to file /builds/slave/test-pgo/properties/build_url 05:06:35 INFO - Contents: 05:06:35 INFO - build_url:https://queue.taskcluster.net/v1/task/Xgllv7XYTiun4XdBZpV-RA/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2 05:06:36 INFO - Running post-action listener: _resource_record_post_action 05:06:36 INFO - Running post-action listener: set_extra_try_arguments 05:06:36 INFO - ##### 05:06:36 INFO - ##### Running populate-webroot step. 05:06:36 INFO - ##### 05:06:36 INFO - Running pre-action listener: _resource_record_pre_action 05:06:36 INFO - Running main action method: populate_webroot 05:06:36 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 05:06:36 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 05:06:36 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 05:06:36 INFO - '--tppagecycles', 05:06:36 INFO - '7'], 05:06:36 INFO - 'tests': ['tsvgm']}}, 05:06:36 INFO - 'suites': {'chromez': {'tests': ['tresize', 'tcanvasmark']}, 05:06:36 INFO - 'chromez-e10s': {'talos_options': ['--e10s'], 05:06:36 INFO - 'tests': ['tresize', 'tcanvasmark']}, 05:06:36 INFO - 'dromaeojs': {'tests': ['dromaeo_css', 'kraken']}, 05:06:36 INFO - 'dromaeojs-e10s': {'talos_options': ['--e10s'], 05:06:36 INFO - 'tests': ['dromaeo_css', 'kraken']}, 05:06:36 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 05:06:36 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 05:06:36 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 05:06:36 INFO - 'talos_options': ['--e10s'], 05:06:36 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 05:06:36 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 05:06:36 INFO - 'tests': ['damp', 'tps']}, 05:06:36 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 05:06:36 INFO - 'talos_options': ['--e10s'], 05:06:36 INFO - 'tests': ['damp', 'tps']}, 05:06:36 INFO - 'g3': {'tests': ['dromaeo_dom']}, 05:06:36 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 05:06:36 INFO - 'other': {'tests': ['a11yr', 05:06:36 INFO - 'ts_paint', 05:06:36 INFO - 'tpaint', 05:06:36 INFO - 'sessionrestore', 05:06:36 INFO - 'sessionrestore_no_auto_restore']}, 05:06:36 INFO - 'other-e10s': {'talos_options': ['--e10s'], 05:06:36 INFO - 'tests': ['a11yr', 05:06:36 INFO - 'ts_paint', 05:06:36 INFO - 'tpaint', 05:06:36 INFO - 'sessionrestore', 05:06:36 INFO - 'sessionrestore_no_auto_restore']}, 05:06:36 INFO - 'other-e10s_l64': {'talos_options': ['--e10s'], 05:06:36 INFO - 'tests': ['a11yr', 05:06:36 INFO - 'ts_paint', 05:06:36 INFO - 'tpaint', 05:06:36 INFO - 'sessionrestore', 05:06:36 INFO - 'sessionrestore_no_auto_restore']}, 05:06:36 INFO - 'other-e10s_nol64': {'talos_options': ['--e10s'], 05:06:36 INFO - 'tests': ['a11yr', 05:06:36 INFO - 'ts_paint', 05:06:36 INFO - 'tpaint', 05:06:36 INFO - 'sessionrestore', 05:06:36 INFO - 'sessionrestore_no_auto_restore']}, 05:06:36 INFO - 'other_l64': {'tests': ['a11yr', 05:06:36 INFO - 'ts_paint', 05:06:36 INFO - 'tpaint', 05:06:36 INFO - 'sessionrestore', 05:06:36 INFO - 'sessionrestore_no_auto_restore']}, 05:06:36 INFO - 'other_nol64': {'tests': ['a11yr', 05:06:36 INFO - 'ts_paint', 05:06:36 INFO - 'tpaint', 05:06:36 INFO - 'sessionrestore', 05:06:36 INFO - 'sessionrestore_no_auto_restore']}, 05:06:36 INFO - 'svgr': {'tests': ['tsvgx', 05:06:36 INFO - 'tsvgr_opacity', 05:06:36 INFO - 'tart', 05:06:36 INFO - 'tscrollx', 05:06:36 INFO - 'cart']}, 05:06:36 INFO - 'svgr-e10s': {'talos_options': ['--e10s'], 05:06:36 INFO - 'tests': ['tsvgx', 05:06:36 INFO - 'tsvgr_opacity', 05:06:36 INFO - 'tart', 05:06:36 INFO - 'tscrollx', 05:06:36 INFO - 'cart']}, 05:06:36 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 05:06:36 INFO - 'tests': ['tp5o']}, 05:06:36 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 05:06:36 INFO - 'talos_options': ['--e10s'], 05:06:36 INFO - 'tests': ['tp5o']}, 05:06:36 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 05:06:36 INFO - 'talos_options': ['--xperf_path', 05:06:36 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 05:06:36 INFO - 'tests': ['tp5n']}, 05:06:36 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 05:06:36 INFO - 'talos_options': ['--e10s', 05:06:36 INFO - '--xperf_path', 05:06:36 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 05:06:36 INFO - 'tests': ['tp5n']}}, 05:06:36 INFO - 'talos.zip': {'path': '', 05:06:36 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 05:06:36 INFO - Running post-action listener: _resource_record_post_action 05:06:36 INFO - ##### 05:06:36 INFO - ##### Running create-virtualenv step. 05:06:36 INFO - ##### 05:06:36 INFO - Running pre-action listener: _resource_record_pre_action 05:06:36 INFO - Running main action method: create_virtualenv 05:06:36 INFO - Creating virtualenv /builds/slave/test-pgo/build/venv 05:06:36 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:06:36 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test-pgo/build/venv 05:06:36 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 05:06:36 INFO - Using real prefix '/usr' 05:06:36 INFO - New python executable in /builds/slave/test-pgo/build/venv/bin/python 05:06:36 INFO - Installing distribute.............................................................................................................................................................................................done. 05:06:38 INFO - Installing pip.................done. 05:06:38 INFO - Return code: 0 05:06:38 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test-pgo/build/venv 05:06:38 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:06:38 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:06:38 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:06:38 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:06:38 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:06:38 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:06:38 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 0x7fdc76b4af10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x25db8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x26a8670>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x27378c0>, '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 0x27387c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2738c50>, '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': 'b5f16d05e5ea93ddf675e67e000001bf-1455541515.16601-1802459910', '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:06:38 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:06:38 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:06:38 INFO - Using env: {'DISPLAY': ':0', 05:06:38 INFO - 'HOME': '/home/cltbld', 05:06:38 INFO - 'LANG': 'en_US.UTF-8', 05:06:38 INFO - 'LANGUAGE': 'en_US:en', 05:06:38 INFO - 'LOGNAME': 'cltbld', 05:06:38 INFO - 'MAIL': '/var/mail/cltbld', 05:06:38 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:06:38 INFO - 'MOZ_NO_REMOTE': '1', 05:06:38 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:06:38 INFO - 'NO_EM_RESTART': '1', 05:06:38 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:06:38 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 05:06:38 INFO - 'PWD': '/builds/slave/test-pgo', 05:06:38 INFO - 'SHELL': '/bin/bash', 05:06:38 INFO - 'SHLVL': '1', 05:06:38 INFO - 'TERM': 'linux', 05:06:38 INFO - 'TMOUT': '86400', 05:06:38 INFO - 'USER': 'cltbld', 05:06:38 INFO - 'XDG_SESSION_COOKIE': 'b5f16d05e5ea93ddf675e67e000001bf-1455541515.16601-1802459910', 05:06:38 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:06:38 INFO - '_': '/tools/buildbot/bin/python'} 05:06:38 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:06:38 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:06:38 INFO - Cleaning up... 05:06:38 INFO - Return code: 0 05:06:38 INFO - Installing psutil>=0.7.1 into virtualenv /builds/slave/test-pgo/build/venv 05:06:38 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:06:38 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:06:38 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:06:38 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:06:38 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:06:38 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:06:38 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 0x7fdc76b4af10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x25db8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x26a8670>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x27378c0>, '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 0x27387c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2738c50>, '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': 'b5f16d05e5ea93ddf675e67e000001bf-1455541515.16601-1802459910', '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:06:38 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:06:38 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:06:38 INFO - Using env: {'DISPLAY': ':0', 05:06:38 INFO - 'HOME': '/home/cltbld', 05:06:38 INFO - 'LANG': 'en_US.UTF-8', 05:06:38 INFO - 'LANGUAGE': 'en_US:en', 05:06:38 INFO - 'LOGNAME': 'cltbld', 05:06:38 INFO - 'MAIL': '/var/mail/cltbld', 05:06:38 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:06:38 INFO - 'MOZ_NO_REMOTE': '1', 05:06:38 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:06:38 INFO - 'NO_EM_RESTART': '1', 05:06:38 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:06:38 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 05:06:38 INFO - 'PWD': '/builds/slave/test-pgo', 05:06:38 INFO - 'SHELL': '/bin/bash', 05:06:38 INFO - 'SHLVL': '1', 05:06:38 INFO - 'TERM': 'linux', 05:06:38 INFO - 'TMOUT': '86400', 05:06:38 INFO - 'USER': 'cltbld', 05:06:38 INFO - 'XDG_SESSION_COOKIE': 'b5f16d05e5ea93ddf675e67e000001bf-1455541515.16601-1802459910', 05:06:38 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:06:38 INFO - '_': '/tools/buildbot/bin/python'} 05:06:39 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:06:39 INFO - Downloading/unpacking psutil>=0.7.1 05:06:39 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:06:39 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:06:39 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:06:39 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:06:39 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:06:39 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:06:40 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/psutil/setup.py) egg_info for package psutil 05:06:41 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 05:06:41 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 05:06:41 INFO - Installing collected packages: psutil 05:06:41 INFO - Running setup.py install for psutil 05:06:41 INFO - building 'psutil._psutil_linux' extension 05:06:41 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:06:41 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:06:41 INFO - building 'psutil._psutil_posix' extension 05:06:41 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:06:41 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:06:41 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 05:06:41 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 05:06:41 INFO - Successfully installed psutil 05:06:41 INFO - Cleaning up... 05:06:41 INFO - Return code: 0 05:06:41 INFO - Installing mozsystemmonitor==0.0.0 into virtualenv /builds/slave/test-pgo/build/venv 05:06:41 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://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:06:41 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:06:41 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:06:41 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://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:06:41 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:06:41 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:06:41 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 0x7fdc76b4af10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x25db8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x26a8670>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x27378c0>, '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 0x27387c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2738c50>, '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': 'b5f16d05e5ea93ddf675e67e000001bf-1455541515.16601-1802459910', '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:06:41 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:06:41 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:06:41 INFO - Using env: {'DISPLAY': ':0', 05:06:41 INFO - 'HOME': '/home/cltbld', 05:06:41 INFO - 'LANG': 'en_US.UTF-8', 05:06:41 INFO - 'LANGUAGE': 'en_US:en', 05:06:41 INFO - 'LOGNAME': 'cltbld', 05:06:41 INFO - 'MAIL': '/var/mail/cltbld', 05:06:41 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:06:41 INFO - 'MOZ_NO_REMOTE': '1', 05:06:41 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:06:41 INFO - 'NO_EM_RESTART': '1', 05:06:41 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:06:41 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 05:06:41 INFO - 'PWD': '/builds/slave/test-pgo', 05:06:41 INFO - 'SHELL': '/bin/bash', 05:06:41 INFO - 'SHLVL': '1', 05:06:41 INFO - 'TERM': 'linux', 05:06:41 INFO - 'TMOUT': '86400', 05:06:41 INFO - 'USER': 'cltbld', 05:06:41 INFO - 'XDG_SESSION_COOKIE': 'b5f16d05e5ea93ddf675e67e000001bf-1455541515.16601-1802459910', 05:06:41 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:06:41 INFO - '_': '/tools/buildbot/bin/python'} 05:06:41 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:06:41 INFO - Downloading/unpacking mozsystemmonitor==0.0.0 05:06:41 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:06:41 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:06:41 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:06:41 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:06:41 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:06:41 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:06:43 INFO - Downloading mozsystemmonitor-0.0.tar.gz 05:06:43 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 05:06:43 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:06:43 INFO - Installing collected packages: mozsystemmonitor 05:06:43 INFO - Running setup.py install for mozsystemmonitor 05:06:43 INFO - Successfully installed mozsystemmonitor 05:06:43 INFO - Cleaning up... 05:06:43 INFO - Return code: 0 05:06:43 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test-pgo/build/venv 05:06:43 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 05:06:43 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:06:43 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:06:43 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 05:06:43 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:06:43 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:06:43 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 0x7fdc76b4af10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x25db8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x26a8670>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x27378c0>, '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 0x27387c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2738c50>, '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': 'b5f16d05e5ea93ddf675e67e000001bf-1455541515.16601-1802459910', '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:06:43 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:06:43 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:06:43 INFO - Using env: {'DISPLAY': ':0', 05:06:43 INFO - 'HOME': '/home/cltbld', 05:06:43 INFO - 'LANG': 'en_US.UTF-8', 05:06:43 INFO - 'LANGUAGE': 'en_US:en', 05:06:43 INFO - 'LOGNAME': 'cltbld', 05:06:43 INFO - 'MAIL': '/var/mail/cltbld', 05:06:43 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:06:43 INFO - 'MOZ_NO_REMOTE': '1', 05:06:43 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:06:43 INFO - 'NO_EM_RESTART': '1', 05:06:43 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:06:43 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 05:06:43 INFO - 'PWD': '/builds/slave/test-pgo', 05:06:43 INFO - 'SHELL': '/bin/bash', 05:06:43 INFO - 'SHLVL': '1', 05:06:43 INFO - 'TERM': 'linux', 05:06:43 INFO - 'TMOUT': '86400', 05:06:43 INFO - 'USER': 'cltbld', 05:06:43 INFO - 'XDG_SESSION_COOKIE': 'b5f16d05e5ea93ddf675e67e000001bf-1455541515.16601-1802459910', 05:06:43 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:06:43 INFO - '_': '/tools/buildbot/bin/python'} 05:06:44 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:06:44 INFO - Downloading/unpacking blobuploader==1.2.4 05:06:44 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:06:44 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:06:44 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:06:44 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:06:44 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:06:44 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:06:45 INFO - Downloading blobuploader-1.2.4.tar.gz 05:06:45 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 05:06:46 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 05:06:46 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:06:46 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:06:46 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:06:46 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:06:46 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:06:46 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:06:46 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/requests/setup.py) egg_info for package requests 05:06:46 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 05:06:46 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:06:46 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:06:46 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:06:46 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:06:46 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:06:46 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:06:46 INFO - Downloading docopt-0.6.1.tar.gz 05:06:46 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/docopt/setup.py) egg_info for package docopt 05:06:46 INFO - Installing collected packages: blobuploader, requests, docopt 05:06:46 INFO - Running setup.py install for blobuploader 05:06:46 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 05:06:46 INFO - changing mode of /builds/slave/test-pgo/build/venv/bin/blobberc.py to 775 05:06:46 INFO - Running setup.py install for requests 05:06:47 INFO - Running setup.py install for docopt 05:06:47 INFO - Successfully installed blobuploader requests docopt 05:06:47 INFO - Cleaning up... 05:06:47 INFO - Return code: 0 05:06:47 INFO - Installing None into virtualenv /builds/slave/test-pgo/build/venv 05:06:47 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 05:06:47 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:06:47 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:06:47 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 05:06:47 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:06:47 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:06:47 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 0x7fdc76b4af10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x25db8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x26a8670>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x27378c0>, '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 0x27387c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2738c50>, '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': 'b5f16d05e5ea93ddf675e67e000001bf-1455541515.16601-1802459910', '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:06:47 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:06:47 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:06:47 INFO - Using env: {'DISPLAY': ':0', 05:06:47 INFO - 'HOME': '/home/cltbld', 05:06:47 INFO - 'LANG': 'en_US.UTF-8', 05:06:47 INFO - 'LANGUAGE': 'en_US:en', 05:06:47 INFO - 'LOGNAME': 'cltbld', 05:06:47 INFO - 'MAIL': '/var/mail/cltbld', 05:06:47 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:06:47 INFO - 'MOZ_NO_REMOTE': '1', 05:06:47 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:06:47 INFO - 'NO_EM_RESTART': '1', 05:06:47 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:06:47 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 05:06:47 INFO - 'PWD': '/builds/slave/test-pgo', 05:06:47 INFO - 'SHELL': '/bin/bash', 05:06:47 INFO - 'SHLVL': '1', 05:06:47 INFO - 'TERM': 'linux', 05:06:47 INFO - 'TMOUT': '86400', 05:06:47 INFO - 'USER': 'cltbld', 05:06:47 INFO - 'XDG_SESSION_COOKIE': 'b5f16d05e5ea93ddf675e67e000001bf-1455541515.16601-1802459910', 05:06:47 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:06:47 INFO - '_': '/tools/buildbot/bin/python'} 05:06:47 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:06:47 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/manifestparser 05:06:47 INFO - Running setup.py (path:/tmp/pip-ejrQa7-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/manifestparser 05:06:47 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozcrash 05:06:47 INFO - Running setup.py (path:/tmp/pip-O4ek9c-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozcrash 05:06:47 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdebug 05:06:47 INFO - Running setup.py (path:/tmp/pip-L27pnZ-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdebug 05:06:47 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdevice 05:06:47 INFO - Running setup.py (path:/tmp/pip-Q3m0v1-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdevice 05:06:47 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozfile 05:06:47 INFO - Running setup.py (path:/tmp/pip-KvavNS-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozfile 05:06:47 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozhttpd 05:06:47 INFO - Running setup.py (path:/tmp/pip-DtpbLN-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozhttpd 05:06:47 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinfo 05:06:47 INFO - Running setup.py (path:/tmp/pip-WCPrON-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinfo 05:06:48 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinstall 05:06:48 INFO - Running setup.py (path:/tmp/pip-IXvsNX-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinstall 05:06:48 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozleak 05:06:48 INFO - Running setup.py (path:/tmp/pip-8050S1-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozleak 05:06:48 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozlog 05:06:48 INFO - Running setup.py (path:/tmp/pip-_6Yvhh-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozlog 05:06:48 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moznetwork 05:06:48 INFO - Running setup.py (path:/tmp/pip-fhdJM4-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moznetwork 05:06:48 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprocess 05:06:48 INFO - Running setup.py (path:/tmp/pip-PK4rim-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprocess 05:06:48 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprofile 05:06:48 INFO - Running setup.py (path:/tmp/pip-KB47DB-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprofile 05:06:48 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozrunner 05:06:48 INFO - Running setup.py (path:/tmp/pip-oqXBme-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozrunner 05:06:48 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 05:06:48 INFO - Running setup.py (path:/tmp/pip-1b6s6S-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 05:06:48 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moztest 05:06:48 INFO - Running setup.py (path:/tmp/pip-mwwkf5-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moztest 05:06:48 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozversion 05:06:48 INFO - Running setup.py (path:/tmp/pip-NdAodf-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozversion 05:06:48 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 05:06:48 INFO - Running setup.py install for manifestparser 05:06:48 INFO - Installing manifestparser script to /builds/slave/test-pgo/build/venv/bin 05:06:48 INFO - Running setup.py install for mozcrash 05:06:48 INFO - Running setup.py install for mozdebug 05:06:49 INFO - Running setup.py install for mozdevice 05:06:49 INFO - Installing sutini script to /builds/slave/test-pgo/build/venv/bin 05:06:49 INFO - Installing dm script to /builds/slave/test-pgo/build/venv/bin 05:06:49 INFO - Running setup.py install for mozfile 05:06:49 INFO - Running setup.py install for mozhttpd 05:06:49 INFO - Installing mozhttpd script to /builds/slave/test-pgo/build/venv/bin 05:06:49 INFO - Running setup.py install for mozinfo 05:06:49 INFO - Installing mozinfo script to /builds/slave/test-pgo/build/venv/bin 05:06:49 INFO - Running setup.py install for mozInstall 05:06:49 INFO - Installing moz_remove_from_system script to /builds/slave/test-pgo/build/venv/bin 05:06:49 INFO - Installing mozuninstall script to /builds/slave/test-pgo/build/venv/bin 05:06:49 INFO - Installing mozinstall script to /builds/slave/test-pgo/build/venv/bin 05:06:49 INFO - Installing moz_add_to_system script to /builds/slave/test-pgo/build/venv/bin 05:06:49 INFO - Running setup.py install for mozleak 05:06:49 INFO - Running setup.py install for mozlog 05:06:49 INFO - Installing structlog script to /builds/slave/test-pgo/build/venv/bin 05:06:49 INFO - Running setup.py install for moznetwork 05:06:49 INFO - Installing moznetwork script to /builds/slave/test-pgo/build/venv/bin 05:06:49 INFO - Running setup.py install for mozprocess 05:06:50 INFO - Running setup.py install for mozprofile 05:06:50 INFO - Installing mozprofile script to /builds/slave/test-pgo/build/venv/bin 05:06:50 INFO - Installing diff-profiles script to /builds/slave/test-pgo/build/venv/bin 05:06:50 INFO - Installing view-profile script to /builds/slave/test-pgo/build/venv/bin 05:06:50 INFO - Running setup.py install for mozrunner 05:06:50 INFO - Installing mozrunner script to /builds/slave/test-pgo/build/venv/bin 05:06:50 INFO - Running setup.py install for mozscreenshot 05:06:50 INFO - Running setup.py install for moztest 05:06:50 INFO - Running setup.py install for mozversion 05:06:50 INFO - Installing mozversion script to /builds/slave/test-pgo/build/venv/bin 05:06:50 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 05:06:50 INFO - Cleaning up... 05:06:50 INFO - Return code: 0 05:06:50 INFO - Installing None into virtualenv /builds/slave/test-pgo/build/venv 05:06:50 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://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:06:50 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:06:50 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:06:50 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://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:06:50 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:06:50 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:06:50 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 0x7fdc76b4af10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x25db8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x26a8670>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x27378c0>, '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 0x27387c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2738c50>, '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': 'b5f16d05e5ea93ddf675e67e000001bf-1455541515.16601-1802459910', '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:06:50 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:06:50 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:06:50 INFO - Using env: {'DISPLAY': ':0', 05:06:50 INFO - 'HOME': '/home/cltbld', 05:06:50 INFO - 'LANG': 'en_US.UTF-8', 05:06:50 INFO - 'LANGUAGE': 'en_US:en', 05:06:50 INFO - 'LOGNAME': 'cltbld', 05:06:50 INFO - 'MAIL': '/var/mail/cltbld', 05:06:50 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:06:50 INFO - 'MOZ_NO_REMOTE': '1', 05:06:50 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:06:50 INFO - 'NO_EM_RESTART': '1', 05:06:50 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:06:50 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 05:06:50 INFO - 'PWD': '/builds/slave/test-pgo', 05:06:50 INFO - 'SHELL': '/bin/bash', 05:06:50 INFO - 'SHLVL': '1', 05:06:50 INFO - 'TERM': 'linux', 05:06:50 INFO - 'TMOUT': '86400', 05:06:50 INFO - 'USER': 'cltbld', 05:06:50 INFO - 'XDG_SESSION_COOKIE': 'b5f16d05e5ea93ddf675e67e000001bf-1455541515.16601-1802459910', 05:06:50 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:06:50 INFO - '_': '/tools/buildbot/bin/python'} 05:06:50 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:06:50 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/manifestparser 05:06:50 INFO - Running setup.py (path:/tmp/pip-5Y1P3L-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/manifestparser 05:06:50 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:06:50 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozcrash 05:06:50 INFO - Running setup.py (path:/tmp/pip-NsIQdC-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozcrash 05:06:50 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:06:50 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdebug 05:06:50 INFO - Running setup.py (path:/tmp/pip-ZDiPgm-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdebug 05:06:50 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:06:50 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdevice 05:06:51 INFO - Running setup.py (path:/tmp/pip-CDf1WB-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdevice 05:06:51 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:06:51 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozfile 05:06:51 INFO - Running setup.py (path:/tmp/pip-7dgTQo-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozfile 05:06:51 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:06:51 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozhttpd 05:06:51 INFO - Running setup.py (path:/tmp/pip-ouNIWS-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozhttpd 05:06:51 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:06:51 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinfo 05:06:51 INFO - Running setup.py (path:/tmp/pip-835LLQ-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinfo 05:06:51 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:06:51 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinstall 05:06:51 INFO - Running setup.py (path:/tmp/pip-Eiyi4S-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinstall 05:06:51 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:06:51 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozleak 05:06:51 INFO - Running setup.py (path:/tmp/pip-8D63QN-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozleak 05:06:51 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:06:51 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozlog 05:06:51 INFO - Running setup.py (path:/tmp/pip-dozF82-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozlog 05:06:51 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:06:51 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moznetwork 05:06:51 INFO - Running setup.py (path:/tmp/pip-q879_5-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moznetwork 05:06:51 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:06:51 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprocess 05:06:51 INFO - Running setup.py (path:/tmp/pip-cA1WaI-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprocess 05:06:51 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:06:51 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprofile 05:06:51 INFO - Running setup.py (path:/tmp/pip-BGqDMS-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprofile 05:06:51 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:06:51 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozrunner 05:06:51 INFO - Running setup.py (path:/tmp/pip-0rH8Ta-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozrunner 05:06:51 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:06:51 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 05:06:51 INFO - Running setup.py (path:/tmp/pip-2okNGH-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 05:06:51 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:06:51 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moztest 05:06:51 INFO - Running setup.py (path:/tmp/pip-KAofcv-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moztest 05:06:51 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:06:51 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozversion 05:06:51 INFO - Running setup.py (path:/tmp/pip-oWMA9g-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozversion 05:06:52 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:06:52 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:06:52 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:06:52 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:06:52 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:06:52 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:06:52 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.1->-r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 10)) 05:06:52 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:06:52 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:06:52 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:06:52 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:06:52 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:06:52 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:06:53 INFO - Downloading blessings-1.6.tar.gz 05:06:53 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/blessings/setup.py) egg_info for package blessings 05:06:53 INFO - Installing collected packages: blessings 05:06:53 INFO - Running setup.py install for blessings 05:06:53 INFO - Successfully installed blessings 05:06:53 INFO - Cleaning up... 05:06:54 INFO - Return code: 0 05:06:54 INFO - Done creating virtualenv /builds/slave/test-pgo/build/venv. 05:06:54 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'freeze'] 05:06:54 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip freeze 05:06:54 INFO - Reading from file tmpfile_stdout 05:06:54 INFO - Current package versions: 05:06:54 INFO - argparse == 1.2.1 05:06:54 INFO - blessings == 1.6 05:06:54 INFO - blobuploader == 1.2.4 05:06:54 INFO - docopt == 0.6.1 05:06:54 INFO - manifestparser == 1.1 05:06:54 INFO - mozInstall == 1.12 05:06:54 INFO - mozcrash == 0.16 05:06:54 INFO - mozdebug == 0.1 05:06:54 INFO - mozdevice == 0.48 05:06:54 INFO - mozfile == 1.2 05:06:54 INFO - mozhttpd == 0.7 05:06:54 INFO - mozinfo == 0.9 05:06:54 INFO - mozleak == 0.1 05:06:54 INFO - mozlog == 3.1 05:06:54 INFO - moznetwork == 0.27 05:06:54 INFO - mozprocess == 0.22 05:06:54 INFO - mozprofile == 0.28 05:06:54 INFO - mozrunner == 6.11 05:06:54 INFO - mozscreenshot == 0.1 05:06:54 INFO - mozsystemmonitor == 0.0 05:06:54 INFO - moztest == 0.7 05:06:54 INFO - mozversion == 1.4 05:06:54 INFO - psutil == 3.1.1 05:06:54 INFO - requests == 1.2.3 05:06:54 INFO - wsgiref == 0.1.2 05:06:54 INFO - Installing None into virtualenv /builds/slave/test-pgo/build/venv 05:06:54 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:06:54 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:06:54 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:06:54 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:06:54 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:06:54 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:06:54 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 0x7fdc76b4af10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x25db8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x26a8670>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x27378c0>, '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 0x27387c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2738c50>, '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': 'b5f16d05e5ea93ddf675e67e000001bf-1455541515.16601-1802459910', '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:06:54 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:06:54 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:06:54 INFO - Using env: {'DISPLAY': ':0', 05:06:54 INFO - 'HOME': '/home/cltbld', 05:06:54 INFO - 'LANG': 'en_US.UTF-8', 05:06:54 INFO - 'LANGUAGE': 'en_US:en', 05:06:54 INFO - 'LOGNAME': 'cltbld', 05:06:54 INFO - 'MAIL': '/var/mail/cltbld', 05:06:54 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:06:54 INFO - 'MOZ_NO_REMOTE': '1', 05:06:54 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:06:54 INFO - 'NO_EM_RESTART': '1', 05:06:54 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:06:54 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 05:06:54 INFO - 'PWD': '/builds/slave/test-pgo', 05:06:54 INFO - 'SHELL': '/bin/bash', 05:06:54 INFO - 'SHLVL': '1', 05:06:54 INFO - 'TERM': 'linux', 05:06:54 INFO - 'TMOUT': '86400', 05:06:54 INFO - 'USER': 'cltbld', 05:06:54 INFO - 'XDG_SESSION_COOKIE': 'b5f16d05e5ea93ddf675e67e000001bf-1455541515.16601-1802459910', 05:06:54 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:06:54 INFO - '_': '/tools/buildbot/bin/python'} 05:06:54 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:06:54 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:06:54 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:06:54 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:06:54 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:06:54 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:06:54 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:06:54 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:06:54 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:06:54 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:06:54 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:06:54 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:06:54 INFO - Cleaning up... 05:06:54 INFO - Return code: 0 05:06:54 INFO - Installing jsonschema into virtualenv /builds/slave/test-pgo/build/venv 05:06:54 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:06:54 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:06:54 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:06:54 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:06:54 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:06:54 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:06:54 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 0x7fdc76b4af10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x25db8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x26a8670>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x27378c0>, '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 0x27387c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2738c50>, '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': 'b5f16d05e5ea93ddf675e67e000001bf-1455541515.16601-1802459910', '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:06:54 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:06:54 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:06:54 INFO - Using env: {'DISPLAY': ':0', 05:06:54 INFO - 'HOME': '/home/cltbld', 05:06:54 INFO - 'LANG': 'en_US.UTF-8', 05:06:54 INFO - 'LANGUAGE': 'en_US:en', 05:06:54 INFO - 'LOGNAME': 'cltbld', 05:06:54 INFO - 'MAIL': '/var/mail/cltbld', 05:06:54 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:06:54 INFO - 'MOZ_NO_REMOTE': '1', 05:06:54 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:06:54 INFO - 'NO_EM_RESTART': '1', 05:06:54 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:06:54 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 05:06:54 INFO - 'PWD': '/builds/slave/test-pgo', 05:06:54 INFO - 'SHELL': '/bin/bash', 05:06:54 INFO - 'SHLVL': '1', 05:06:54 INFO - 'TERM': 'linux', 05:06:54 INFO - 'TMOUT': '86400', 05:06:54 INFO - 'USER': 'cltbld', 05:06:54 INFO - 'XDG_SESSION_COOKIE': 'b5f16d05e5ea93ddf675e67e000001bf-1455541515.16601-1802459910', 05:06:54 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:06:54 INFO - '_': '/tools/buildbot/bin/python'} 05:06:54 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:06:54 INFO - Downloading/unpacking jsonschema 05:06: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:06: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:06: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:06: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:06: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:06: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:06:56 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 05:06:56 INFO - Downloading/unpacking functools32 (from jsonschema) 05:06: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:06: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:06: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:06: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:06: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:06: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:06:56 INFO - Downloading functools32-3.2.3-2.tar.gz 05:06:56 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/functools32/setup.py) egg_info for package functools32 05:06:56 INFO - warning: no files found matching '*.txt' 05:06:56 INFO - no previously-included directories found matching 'build' 05:06:56 INFO - no previously-included directories found matching 'dist' 05:06:56 INFO - no previously-included directories found matching '.git*' 05:06:56 INFO - Installing collected packages: jsonschema, functools32 05:06:56 INFO - Running setup.py install for functools32 05:06:56 INFO - warning: no files found matching '*.txt' 05:06:56 INFO - no previously-included directories found matching 'build' 05:06:56 INFO - no previously-included directories found matching 'dist' 05:06:56 INFO - no previously-included directories found matching '.git*' 05:06:56 INFO - Successfully installed jsonschema functools32 05:06:56 INFO - Cleaning up... 05:06:57 INFO - Return code: 0 05:06:57 INFO - Installing flake8 into virtualenv /builds/slave/test-pgo/build/venv 05:06:57 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://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:06:57 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:06:57 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:06:57 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://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:06:57 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:06:57 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:06:57 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 0x7fdc76b4af10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x25db8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x26a8670>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x27378c0>, '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 0x27387c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2738c50>, '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': 'b5f16d05e5ea93ddf675e67e000001bf-1455541515.16601-1802459910', '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:06:57 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:06:57 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:06:57 INFO - Using env: {'DISPLAY': ':0', 05:06:57 INFO - 'HOME': '/home/cltbld', 05:06:57 INFO - 'LANG': 'en_US.UTF-8', 05:06:57 INFO - 'LANGUAGE': 'en_US:en', 05:06:57 INFO - 'LOGNAME': 'cltbld', 05:06:57 INFO - 'MAIL': '/var/mail/cltbld', 05:06:57 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:06:57 INFO - 'MOZ_NO_REMOTE': '1', 05:06:57 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:06:57 INFO - 'NO_EM_RESTART': '1', 05:06:57 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:06:57 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 05:06:57 INFO - 'PWD': '/builds/slave/test-pgo', 05:06:57 INFO - 'SHELL': '/bin/bash', 05:06:57 INFO - 'SHLVL': '1', 05:06:57 INFO - 'TERM': 'linux', 05:06:57 INFO - 'TMOUT': '86400', 05:06:57 INFO - 'USER': 'cltbld', 05:06:57 INFO - 'XDG_SESSION_COOKIE': 'b5f16d05e5ea93ddf675e67e000001bf-1455541515.16601-1802459910', 05:06:57 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:06:57 INFO - '_': '/tools/buildbot/bin/python'} 05:06:57 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:06:57 INFO - Downloading/unpacking flake8 05:06:57 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:06:57 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:06:57 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:06:57 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:06:57 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:06:57 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:06:58 INFO - Downloading flake8-2.5.0-py2.py3-none-any.whl 05:06:59 INFO - Downloading/unpacking mccabe>=0.2.1,<0.4 (from flake8) 05:06:59 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:06:59 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:06:59 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:06:59 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:06:59 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:06:59 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:06:59 INFO - Downloading mccabe-0.3.1-py2.py3-none-any.whl 05:06:59 INFO - Downloading/unpacking pyflakes>=0.8.1,<1.1 (from flake8) 05:06:59 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:06:59 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:06:59 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:06:59 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:06:59 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:06:59 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:06:59 INFO - Downloading/unpacking pep8>=1.5.7,!=1.6.0,!=1.6.1,!=1.6.2 (from flake8) 05:06:59 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:06:59 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:06:59 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:06:59 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:06:59 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:06:59 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:06:59 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/pep8/setup.py) egg_info for package pep8 05:06:59 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 05:06:59 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 05:06:59 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 05:06:59 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 05:06:59 INFO - no previously-included directories found matching 'docs/_build' 05:06:59 INFO - Installing collected packages: flake8, mccabe, pyflakes, pep8 05:06:59 INFO - Running setup.py install for pep8 05:06:59 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 05:06:59 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 05:06:59 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 05:06:59 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 05:06:59 INFO - no previously-included directories found matching 'docs/_build' 05:06:59 INFO - Installing pep8 script to /builds/slave/test-pgo/build/venv/bin 05:06:59 INFO - Successfully installed flake8 mccabe pyflakes pep8 05:06:59 INFO - Cleaning up... 05:06:59 INFO - Return code: 0 05:06:59 INFO - Running post-action listener: _resource_record_post_action 05:06:59 INFO - Running post-action listener: _start_resource_monitoring 05:06:59 INFO - Starting resource monitoring. 05:06:59 INFO - ##### 05:06:59 INFO - ##### Running install step. 05:06:59 INFO - ##### 05:06:59 INFO - Running pre-action listener: _resource_record_pre_action 05:06:59 INFO - Running main action method: install 05:06:59 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'freeze'] 05:06:59 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip freeze 05:07:00 INFO - Reading from file tmpfile_stdout 05:07:00 INFO - Detecting whether we're running mozinstall >=1.0... 05:07:00 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/mozinstall', '-h'] 05:07:00 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/mozinstall -h 05:07:00 INFO - Reading from file tmpfile_stdout 05:07:00 INFO - Output received: 05:07:00 INFO - Usage: mozinstall [options] installer 05:07:00 INFO - Options: 05:07:00 INFO - -h, --help show this help message and exit 05:07:00 INFO - -d DEST, --destination=DEST 05:07:00 INFO - Directory to install application into. [default: 05:07:00 INFO - "/builds/slave/test-pgo"] 05:07:00 INFO - --app=APP Application being installed. [default: firefox] 05:07:00 INFO - mkdir: /builds/slave/test-pgo/build/application 05:07:00 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:07:00 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:07:16 INFO - Reading from file tmpfile_stdout 05:07:16 INFO - Output received: 05:07:16 INFO - /builds/slave/test-pgo/build/application/firefox/firefox 05:07:16 INFO - Running post-action listener: _resource_record_post_action 05:07:16 INFO - ##### 05:07:16 INFO - ##### Running run-tests step. 05:07:16 INFO - ##### 05:07:16 INFO - Running pre-action listener: _resource_record_pre_action 05:07:16 INFO - Running main action method: run_tests 05:07:16 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/python', '--version'] 05:07:16 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/python --version 05:07:16 INFO - Python 2.7.3 05:07:16 INFO - Return code: 0 05:07:16 INFO - grabbing minidump binary from tooltool 05:07:16 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://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:07:16 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 0x27378c0>, '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 0x27387c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2738c50>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test-pgo/build', 'privileged': False}, attempt #1 05:07:16 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:07:16 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:07:16 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 05:07:16 INFO - Return code: 0 05:07:16 INFO - Chmoding /builds/slave/test-pgo/build/linux64-minidump_stackwalk to 0755 05:07:16 INFO - mkdir: /builds/slave/test-pgo/build/blobber_upload_dir 05:07:16 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test-pgo/build/blobber_upload_dir 05:07:16 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test-pgo/build/linux64-minidump_stackwalk 05:07:16 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test-pgo/build/blobber_upload_dir 05:07:16 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/flake8', '/builds/slave/test-pgo/build/tests/talos/talos'] 05:07:16 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/flake8 /builds/slave/test-pgo/build/tests/talos/talos 05:07:17 INFO - Return code: 0 05:07:17 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', '--executablePath', '/builds/slave/test-pgo/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/Xgllv7XYTiun4XdBZpV-RA/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-007', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs_errorsummary.log', '--log-raw=/builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs_raw.log'] in /builds/slave/test-pgo/build 05:07:17 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 --executablePath /builds/slave/test-pgo/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/Xgllv7XYTiun4XdBZpV-RA/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-007 --webServer localhost --log-tbpl-level=debug --log-errorsummary=/builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs_errorsummary.log --log-raw=/builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs_raw.log 05:07:17 INFO - Using env: {'DISPLAY': ':0', 05:07:17 INFO - 'HOME': '/home/cltbld', 05:07:17 INFO - 'LANG': 'en_US.UTF-8', 05:07:17 INFO - 'LANGUAGE': 'en_US:en', 05:07:17 INFO - 'LOGNAME': 'cltbld', 05:07:17 INFO - 'MAIL': '/var/mail/cltbld', 05:07:17 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test-pgo/build/blobber_upload_dir', 05:07:17 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test-pgo/build/linux64-minidump_stackwalk', 05:07:17 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:07:17 INFO - 'MOZ_NO_REMOTE': '1', 05:07:17 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test-pgo/build/blobber_upload_dir', 05:07:17 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:07:17 INFO - 'NO_EM_RESTART': '1', 05:07:17 INFO - 'PATH': '/builds/slave/test-pgo/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:07:17 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 05:07:17 INFO - 'PWD': '/builds/slave/test-pgo', 05:07:17 INFO - 'PYTHONPATH': '/builds/slave/test-pgo/build/tests/talos', 05:07:17 INFO - 'SHELL': '/bin/bash', 05:07:17 INFO - 'SHLVL': '1', 05:07:17 INFO - 'TERM': 'linux', 05:07:17 INFO - 'TMOUT': '86400', 05:07:17 INFO - 'USER': 'cltbld', 05:07:17 INFO - 'XDG_SESSION_COOKIE': 'b5f16d05e5ea93ddf675e67e000001bf-1455541515.16601-1802459910', 05:07:17 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:07:17 INFO - '_': '/tools/buildbot/bin/python'} 05:07:17 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', '--executablePath', '/builds/slave/test-pgo/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/Xgllv7XYTiun4XdBZpV-RA/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-007', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs_errorsummary.log', '--log-raw=/builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs_raw.log'] with output_timeout 3600 05:07:17 INFO - mozversion application_buildid: 20160215023002 05:07:17 INFO - mozversion application_changeset: 288bdc6d7788efc3f4476f11abe9c67fb8eadfe5 05:07:17 INFO - mozversion application_display_name: Nightly 05:07:17 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 05:07:17 INFO - mozversion application_name: Firefox 05:07:17 INFO - mozversion application_remotingname: firefox 05:07:17 INFO - mozversion application_repository: https://hg.mozilla.org/integration/fx-team 05:07:17 INFO - mozversion application_vendor: Mozilla 05:07:17 INFO - mozversion application_version: 47.0a1 05:07:17 INFO - mozversion platform_buildid: 20160215023002 05:07:17 INFO - mozversion platform_changeset: 288bdc6d7788efc3f4476f11abe9c67fb8eadfe5 05:07:17 INFO - mozversion platform_repository: https://hg.mozilla.org/integration/fx-team 05:07:17 INFO - mozversion platform_version: 47.0a1 05:07:17 INFO - using testdate: 1455541637 05:07:17 INFO - actual date: 1455541637 05:07:17 INFO - starting webserver on 'localhost:44874' 05:07:17 INFO - SUITE-START | Running 2 tests 05:07:17 INFO - TEST-START | dromaeo_css 05:07:17 INFO - operating with platform_type : linux_ 05:07:17 INFO - Initialising browser for dromaeo_css test... 05:07:17 INFO - TEST-INFO | started process 460 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpwCTvvi/profile http://localhost:44874/getInfo.html) 05:07:22 INFO - PROCESS | 460 | __metrics Screen width/height:1600/1200 05:07:22 INFO - PROCESS | 460 | colorDepth:24 05:07:22 INFO - PROCESS | 460 | Browser inner width/height: 1024/697 05:07:22 INFO - PROCESS | 460 | __metrics 05:07:23 INFO - PROCESS | 460 | JavaScript error: resource://app/modules/WebappManager.jsm, line 48: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 05:07:23 INFO - PROCESS | 460 | JavaScript error: resource://gre/modules/IndexedDBHelper.jsm, line 138: UnknownError: The operation failed for reasons unrelated to the database itself and not covered by any other error code. 05:07:24 INFO - TEST-INFO | 460: exit 0 05:07:24 INFO - Browser initialized. 05:07:24 INFO - Running cycle 1/1 for dromaeo_css test... 05:07:24 INFO - TEST-INFO | started process 555 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpwCTvvi/profile -tp file:/builds/slave/test-pgo/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 05:07:35 INFO - PROCESS | 555 | RSS: Main: 150179840 05:07:35 INFO - PROCESS | 555 | 05:08:27 INFO - PROCESS | 555 | 1455541707385 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:10:35 INFO - PROCESS | 555 | Cycle 1(1): loaded http://localhost:44874/tests/dromaeo/cssquery-dojo.html (next: http://localhost:44874/tests/dromaeo/cssquery-ext.html) 05:10:36 INFO - PROCESS | 555 | RSS: Main: 249118720 05:10:36 INFO - PROCESS | 555 | 05:13:39 INFO - PROCESS | 555 | Cycle 1(1): loaded http://localhost:44874/tests/dromaeo/cssquery-ext.html (next: http://localhost:44874/tests/dromaeo/cssquery-jquery.html) 05:13:39 INFO - PROCESS | 555 | RSS: Main: 229781504 05:13:39 INFO - PROCESS | 555 | 05:16:41 INFO - PROCESS | 555 | Cycle 1(1): loaded http://localhost:44874/tests/dromaeo/cssquery-jquery.html (next: http://localhost:44874/tests/dromaeo/cssquery-mootools.html) 05:16:42 INFO - PROCESS | 555 | RSS: Main: 234868736 05:16:42 INFO - PROCESS | 555 | 05:19:44 INFO - PROCESS | 555 | Cycle 1(1): loaded http://localhost:44874/tests/dromaeo/cssquery-mootools.html (next: http://localhost:44874/tests/dromaeo/cssquery-prototype.html) 05:19:44 INFO - PROCESS | 555 | RSS: Main: 214650880 05:19:44 INFO - PROCESS | 555 | 05:22:47 INFO - PROCESS | 555 | Cycle 1(1): loaded http://localhost:44874/tests/dromaeo/cssquery-prototype.html (next: http://localhost:44874/tests/dromaeo/cssquery-yui.html) 05:22:47 INFO - PROCESS | 555 | RSS: Main: 216440832 05:22:47 INFO - PROCESS | 555 | 05:25:50 INFO - PROCESS | 555 | Cycle 1(1): loaded http://localhost:44874/tests/dromaeo/cssquery-yui.html (next: http://localhost:44874/tests/dromaeo/cssquery-dojo.html) 05:25:50 INFO - PROCESS | 555 | RSS: Main: 269697024 05:25:50 INFO - PROCESS | 555 | 05:25:50 INFO - PROCESS | 555 | __start_tp_report 05:25:50 INFO - PROCESS | 555 | _x_x_mozilla_page_load 05:25:50 INFO - PROCESS | 555 | _x_x_mozilla_page_load_details 05:25:50 INFO - PROCESS | 555 | |i|pagename|runs| 05:25:50 INFO - PROCESS | 555 | |0;dojo.html;3078.1996680862976;3131.326764745579;3171.9682803171977;3174.5396917446956;3201.3117179806345;5084.79660813567;5091.032703786278;5151.381834179899;5156.948430515698;5183.559397451221;5090.287359769635;5105.668131571455;5136.075506408845;5150.27896094547;5151.175811870102;4663.463701674317;4670.626349892001;4723.551262630044;4771.570558649721;4796.784144713479;4679.3682852814945;4722.5513576210205;4735.360726301939;4772;4853.102176097434;4686.133065382898;4727;4728.787204575768;4757.619390448755;4773.093112308685;4678.649101317381;4680.040591678698;4690.296455531663;4696.060787842411;4732.787024583902;4651.209294419923;4661.417322834645;4665.5567721066445;4667.089917466095;4714.151452738506;5085.466026067246;5105.2086926526445;5114.181730923035;5127.307813445174;5129.666571672829;5604.1593760935775;5623.49388555028;5629.268195134648;5629.887402251973;5669.603127781057;5521.585881058896;5557.5831812614215;5621.887562248773;5672.319321681383;5678.063119585264;5178.559822415099;5199.2461093141665;5202.0896343140175;5213.530782229617;5236.293100431393;5612.017896868032;5621.80323688669;5629.577781666309;5630.40880707528;5636.464535869086;5362.812301569426;5388.9730551347775;5483.588730845203;5488.4237155098135;5523.6685798852195;5593.300837395325;5607.80372686954;5611.6352437091455;5615.6630602164005;5623.044082505984;5425.674459532441;5546.556275498031;5565.471280228372;5569;5592.356878958891;5463.535599474009;5508.173773933942;5513.917291240635;5542.334919809648;5607.551395888319;4315.784210789448;4335.674824388184;4342.5006124296115;4357.694961352675;4374.4531933508315;3836.3094642963974;3855.63371479709;3858.3247931611854;3882.281777871103;3902.8829135125993;5025.221090730869;5096.61775366849;5106.259592359087;5148.536631703089;5179.922301165486;5564.054110801174;5565.3599836019375;5566.081596536607;5566.35986861508;5581.944180558224;5093;5161.174212126117;5171.069207542679;5179.22311653255;5208.0365132450615;4665.230237010923;4725.64557658177;4761.35721677576;4778.068276686013;4823.27650852375;5673.858153546194;5697.914531282034;5702.942970570324;5705.22979397776;5707.543396528268;5383.67697938125;5530.312865117409;5532.529734972572;5537.418571049981;5584.385717570983;5652.7738890443925;5678.630888992202;5720.48515633595;5744.770209191585;5789.681567513827;5420.078586640359;5421.864453388697;5427.050266203478;5429.484199001088;5430.294061771944;5454.563634909118;5474.835754927359;5527.474889885454;5572.637778544382;5572.637778544382;5368.543673787772;5369.919451208313;5421.295231619864;5434.347878254634;5475.67145971243;5374.57003439716;5393.298871146726;5394.406615272238;5402.081646120248;5441.564674826083;5235.319408477026;5319.521243088141;5328;5351.277577526984;5376.973115134399;5413.458654134555;5464.453554644504;5465.262189604353;5483.341998960151;5519.365272993497;5356.678599284055;5358.705271210121;5359.892802144013;5363.490468405495;5363.704996225245 05:25:50 INFO - PROCESS | 555 | |1;ext.html;492.2198315669663;513.9331886854714;543.4999800183829;557.4787573618667;557.9788986155336;25481.235562933118;35895.46156807647;36283.45574816373;36325.455118173246;36379.27241455169;38384.80807595958;38904.416433753446;39043.80478097613;39099.21801563967;39159.80420097896;7474.402047836187;7606.543607383574;8391.496510209407;8609.483430994129;8618.396712230146;9895.208383329316;10159.898401016006;10178.18574514037;10179.185665146808;10187.235957303232;10056.547455364525;10247.590096396136;10261.076503114718;10261.794764104714;10263.076323130917;10052.195824334036;10157.441340726256;10165.542550585167;10172.44051577163;10176.796464070714;10050.547725352377;10200.030997055268;10208.336458130272;10477.9476102619;10518.579256829718;35918.82040589806;36261.81869090664;36274.27451450956;36382.63617363819;36442.81778591117;2868.956965645517;2957.393734284488;3231.692989166049;3481.216726236602;3688.4098544232793;27313.86343068272;27359.179224623294;27479.725202748115;27763.722362776316;28088.719112808816;3876.2441323941844;3940.2513522430645;3984.083660758042;3985.322495175798;3992.640662340403;268036;268983;269990;270141;273968.6301568499;56972.14541781876;58014;58017;58037.41962580405;58097.70951145302;51383.7430812851;51397;51583.48416515862;51703.74148129235;51725.48274517206;15411.922940385226;15451.227438628024;15479.148646824307;15559.377624895104;15582.922085389728;11665.35840528779;11924.284542927453;11959.103067269989;12099.818502722466;12138.393080345948;18298;18565.907170464063;18684.34604788853;18709.81290187108;18818.90590547066;6158.938410615926;6267.4045965633195;6298.464630506367;6303.581694118787;6391.201099862517;879.9340049496313;898.595631965618;913.0048247410355;937.5406051034944;989.475577943691;26189.73810261911;26402.471950561267;26421.33946651349;26504.204873853814;26771.598426023626;919.2370332623906;990.1385794358954;1012.64051261801;1102.7573933734566;1155.3530023187043;12479.56321528742;12631.936840315924;13855.584332470042;14024.859751402355;14311.35598898052;304788;310333;310715;311206;311967;46359.30461043087;46604.7669761649;46649.7667511667;46660;46666;1198.6044605280238;1274.6048724895313;1284.9290196430352;1331.10150648312;1347.2455424961856;24889.50220995534;25119.87440062861;26239.212823615322;27049.59425608578;27514.587281190397;41408.58591414168;41821;41834.37248441337;41837;41858.37212441755;284893;289372;290645;291772;361307;27639.723602763715;27898.30254243579;27956.301092472037;27982.440351192454;27997.160085197476;32271.51592726158;42172.789136054125;42966.57033429626;43041.13917721691;44320.335194972744;27641.861790690917;27672.16983490418;27675.86162069177;28146.01488947877;28694.426111477234;29292.41415171642;29356.266093347836;29556.408871822012;29815;35332.64667353396;28652.85673571702;29115;29166.125016249545;29230.561541577317;29531.55702664505;25901.870490647427;26241.475170496866;32057;33196.50205246972;33520.49719254262;20742.896285518476;20833.89583052075;20957.58084838264;21031.789682102983;21136.894315528323 05:25:50 INFO - PROCESS | 555 | |2;jquery.html;350.6458476938293;358.5786700626763;363.3677401321701;372.4878292348021;373.5778570215656;13121.803172952414;13611.93194034031;16160.676786464264;16299.674006519863;16701.582460438494;14055.016148869558;14061.578152655436;15697;15960.201989900517;15962;5279.973600131994;5341.946580534183;5453.400125986138;5453.481919217687;5462.126059830428;3705.759125656837;5269.209618557209;5398.946010539884;5469.179623056533;5487.862803429906;5341.225522299264;5378.547792096132;5445.428230035848;5471.288732464774;5484.808031718891;5434.538064264542;5436.320459942507;5444.8366549003595;5447.45525447456;5450.29146210994;5140.948590514085;5181.559567436772;5231.058409486291;5253.605979551549;5256.474352564751;11995.64013079609;12190.756184876342;12878.80681789774;19284.22863085475;19317.51706207342;2001.2495314257153;2046.4474591860264;2069.6791997240452;2169.7721739217473;2664.027629915067;8830.911690883073;9294;9392.62429502819;9404.106609872051;9418.152366286999;1700.7703959965493;1720.8365205305477;1766.911654417274;1770.238797317153;1785.9374921877802;59743.70128149375;60442;60493.6975315125;61068;61355.693221533606;10030.548625311878;10170.288079834341;10173.186145108373;10179.898201018043;10188.184945204513;12983.935080324538;13729.725405492034;13747.931260343634;13753.449862005607;13760.93119534396;7125.216226215112;7272.454565907472;7467.701291948261;7504.399648028145;7744.225577442211;7534.811629709301;7537.924620753723;7540.057492813398;7548.962255188689;7581.469297149257;4061.634452899253;4366.388705581221;4409.845655402046;4458.08609235106;4466.307722303049;1704.6249825038471;1728.4875733732983;1738.1135620833466;1779.1815764748103;1849.833514983658;728.806866180452;729.1323325242944;747.1072068877639;810.266708628692;838.6310023589723;14750.704985900222;14907.180105094107;15061.548153555412;15130.54608361751;15233.466828661165;364.10067134178536;373.38205270277734;385.4007019085293;403.58632401787816;427.53398795313257;4812.807487700523;4994.076095922266;5013.172826483662;5155.097857874857;5223;348178;530860;531819;558519;567990;50378.49621503738;62914.68542657349;67240.32759672341;67255;69458;504.5509496548002;512.1651707716399;512.3032675561234;512.805134049059;513.9768710408041;10544.683659490227;14024.509142179975;14824.703505930036;15082.321295541946;15134.545963621109;33181;33189.668103318654;34020.65979340274;34478.13804654904;35491.46762798508;40173.799131004154;41610;41682.374764379165;41899.58100418957;42051.369229462194;7540.434467415075;7559.886601700869;7564.886526701994;7637.083549973817;7667.616619168908;10711.464426778786;11467.713307167387;11810.527578896748;11952.940235298767;12055.698607534881;9900.702978910644;10053.597856085675;10244.795104098026;10455.111315538265;10573.52419141125;10153.289269751047;10382.428966406618;10417.322874013165;10465.895341046493;10698.197635177237;7795.64919578609;10293.228007899288;10560;10630.73423164427;10712.143028557852;7307.26927307265;7393.149787774475;7398.741044063432;7401.666924988281;7540.208278130936;9905.356151850106;10227.539760710637;10276.383416995004;10440;10503.78992420132 05:25:50 INFO - PROCESS | 555 | |3;mootools.html;1213.8361321221632;1276.4000919567802;1306.4512904580076;1307.542360173939;1482.6071091160852;7101.680424380902;7614.543127412359;7799.493032952854;7807.45347825651;7807.609619519029;7815.218478152182;7885.842283154333;7927.20727927207;7958.880616790752;7965.800854978628;1933.9323123690674;1973.9111739971736;2218.955620887585;2234.944126396837;2240.283109404991;2174.8912554372296;2232.363776323748;2233.6984507091497;2236.194969810867;2238.2613737466595;2178.4444966533592;2207.4371035386034;2238.608243557379;2240.283109404991;2241.529278851443;2116.8518203725744;2130;2199.472126689591;2202.8678279303213;2204.2505548113636;2228.8551244169075;2246.7528571857083;2251.493413981841;2251.9887400563057;2264.049099378265;7960.522368657841;8011.118776934532;8016.559089250089;8019.2381723736735;8024.799380015546;4751.524847515221;4856.805727770885;4928.211486162197;4931.4821943696115;4946.851594452172;3165;3173.539836723662;3253.430649636304;3299.703026727606;3311.106001379638;990.8018396320692;1005.6580762540772;1035.7773078788098;1079.3092420850662;1112.0165361529607;11078.390688512129;11081.72295692598;11085.667429977113;11104.944475277573;11110.888891111066;4310.698251122391;4403.339499075164;4451.621612163002;4490;4560.726356418625;8299.875501867476;8574.185452382013;8576.313894888393;8583.313334933191;8593.312534997185;4755.738434386142;4797.664163508521;4798.4001999750035;4799.0401919616215;4803.735794531334;4408.713433626804;4438.068005718836;4441.689081764245;4442.955570444255;4445.26653102241;3295.20914980403;3468.4103702370153;3495.598006229265;3504.351694936445;3517.2086280586664;1067.8398240263866;1100.1254003067581;1100.2298391126244;1109.5229051507768;1125.5047778977223;838.6351936907465;892.834825557274;1150.7640933608757;1184.620921305174;1188.2157775867886;7422.665980030912;7433.331000210007;7437.516561423598;7458.627068646546;7471.925280747231;1052.6999805055523;1062.527175406952;1072.0458791675414;1078.6170909327234;1100.5872797700863;5807.128930660435;5923.585349025527;5927.555433342516;5928.7332070056955;5979.252593425822;9447.574859131355;9465.716028519155;9649.469279189572;9685.467299298465;9776.902230977741;9571.952140239255;9632.807343853083;9640.132388085107;9660.420374777535;9664.661736839176;7324.560526368328;7473.476856619985;7508.587027713528;7547.811304717426;7548.886766698504;6844.076049733222;6917.550359226634;6928.688209030505;6934.514583979073;6946.097007389007;8274.172582741678;8515.27620152294;8556.016058153393;8641.308695304235;8641.783955401166;8762.685597160476;8816.074312197126;8818.603162857815;8877.20105190536;8990.460572365679;6372.681365931778;6481.546291759721;6495.480361571157;6512.772052978123;6515.120458738199;6644.867102658017;7147.499675022698;7343.2289609590225;7359.742409015873;7387.335139837441;6746.5277430581355;6793.490488213305;6814.352636499525;6974.197967233833;7047.224805271519;6687.164104486939;6860.931390686029;6915.93084069173;6953.26990665993;7003;6606.504512161703;6659.7003134860015;6670.39966403026;6672.966635166793;6674;5987.970060149672;6301.40136687014;6305.085762564494;6313.589616674902;6314.116023756769;6244.406781355764;6271.498280137487;6275.184226050585;6276.717547710273;6288.717007734572 05:25:50 INFO - PROCESS | 555 | |4;prototype.html;344.41277621655064;345.082081662777;345.4507333339992;346.3194822174427;347.9652034796521;5832.300123985117;5890.352061273262;5947.821565353035;5996.1605375247445;6008.279006519213;5694.971525142369;5818.941810581893;5824.825255242339;5827.708614569276;5843.678597677137;4585.037142200125;4585.9770701146535;4587.403637527117;4596.4254468191475;4602.470715867667;4361.258586040381;4458.8885277867985;4550.522195169509;4589.5410458954175;4606.309053641964;4498.865034048984;4522.5025247222775;4541.636669066466;4552.430946131733;4554.863354099382;4554.316852472122;4561.817527298937;4563.612092972101;4563.840265590688;4567.543245675439;4020.618041286073;4026.396040593905;4027.2952233359047;4029.4358789769162;4030.3954406839207;5503.834884953418;5553.972230138824;5615.578831587647;5667.064934285838;5681.914771278434;5255.60582956276;5256.106461901486;5258.6318957672975;5263.710495922723;5264.499872512105;5970.97014514929;6315.621062736204;6323.462505687022;6324.399182077741;6324.968375158141;4241.618254357092;4317.15815415994;4331.047169622678;4353.84761533348;4366.323219900921;6491.93508064918;6539;6549.836254093638;6557.803265902078;6559.409653131241;4445.377647129404;4454.57681520255;4458.063806600585;4464.1071785643;4467.508574056851;4437.134758722018;4514.187446259705;4526.117407105583;4527.388802511685;4546.249868771615;5215.113430716788;5226.660267082703;5227.947720522746;5230.37235531731;5234.476552344811;6310.9368906311265;6314.621122732558;6318.905216421757;6320.146780184617;6321.620702757849;1577.3138684672203;1598.3606557376909;1598.9200539972956;1601.295430010815;1602.7756114144029;1050.9894901051046;1058.2909450668071;1072.8337107748312;1080.5245691895698;1099.1371773158032;6011.098335249748;6014.278286605635;6014.6391216527145;6022.488088512438;6024.728887200086;6501.2523559791225;6511.674416279167;6514.57655252407;6518.152640156844;6518.967405163039;5903.970480147572;6003.429674180946;6004.099385092184;6006.759729610854;6008.369121242294;3451.741119416054;3510.210202704371;3518.1028837646236;3522.7181825453904;3526.612072672004;6778.491613129035;6782.660866956632;6784.7964561063245;6786.049953006583;6790.1851777786;6665.966670166618;6667.433268172163;6669.032990216391;6675.79972600813;6677.1319728435965;6555.836104097436;6740.561863478858;6760.763373281911;6768.898466523006;6769.1538557679305;6271.498280137487;6470.805875823733;6507.349265073455;6521.673916304071;6526.771562995273;6484.773032943825;6495;6506.3493650634555;6515.250746164063;6529;6840.863182736417;6854.143232095988;6854.897176542256;6856.108705868404;6858.931410685829;4366;4478.462584489752;4482.081173359388;4483.641308695232;4489.483709373333;6575.309592492719;6576.473882089517;6582.736690532325;6601.735930562723;6662.700178491883;6362.300146983921;6377.936220637735;6392.360763923571;6392.488600912009;6393.680315984275;6216.098665693539;6321.652309122858;6340.1123842661145;6360.681965901779;6412.743490260524;6292.685365731603;6298.212723409574;6302.527310451826;6302.590331628429;6306.400891915261;6446.066180146031;6453.9354606453335;6455.354464553507;6456.354364563506;6456.677166141768;6055.757769689163;6239.75040998355;6306.4639505642535;6306.747730090929;6315.242170939517 05:25:50 INFO - PROCESS | 555 | |5;yui.html;595.8540157661373;707.9469039822011;709.0852799888145;729.9890501642473;732.8680837449264;12574.874251257485;12881.098323117361;12890.419931103099;12894.677633059166;12911.612651620455;13610.183388996642;13857.445702171926;13920.930395348008;13927.37326820293;13962.511312104078;639.3159319528107;651.8859199640044;799.4803377804444;804.0512195609178;805.2591615713558;767.6814122139306;774.3069952392606;780.0210735526935;782.4992005116729;783.4006984656742;829.9087100418949;830.5847076461769;832.5504227717025;832.5629044751494;847.6694089305176;656.4649810404505;796.5141263829059;823.7816978500703;830.2776584371605;831.9126491718404;613.3437222172278;617.1945610977672;617.2407938235995;617.6757202468694;619.0466681310776;12475.875241247653;12513.562025329069;12516.186447880858;12547.74904501914;12568.371581420892;11519.48162332697;12170.75658486834;12358.25850448967;12469.127161098726;12705.682357941034;9702.466364349957;9779;9963.352382095212;10039.89960100397;10081.647142350055;3524.6299138590334;3530.2409981853766;3549.6627820357025;3554.253606742587;3556.199855032623;46658.30012549814;46925.76537117293;46950.76524617389;47692.284615730794;47710.28434573449;9601;9738.561764720605;9768.120869121813;10026.147777438999;10060.899391006142;16308.26612802403;16485.58786030335;16494.917525412297;16538.917305413397;16614.00315981045;7460.179380268166;7547.811304717426;7581.166071732105;7591.810204744926;7706.922930770733;4006.8397264109108;4054.006768341775;4079.347304431277;4187.91624167515;4286.099919016979;2921.5033444314518;2955.0100716259863;2958.65975412826;2960.378320552708;3058.0520038788045;552.033940603943;565.2087078090624;572.9971350143222;573.435166361134;583.116578383749;514.5394871589981;542.289600623177;559.6222549778882;578.3262499188482;582.2169182449599;7130.909235732203;7395.519291246052;7497.2877576630135;7511.32398084175;7606.163322034572;496.19616221721043;532.478171392038;579.9797007104731;580.3355158343672;590.6367583935848;3380.2732412531423;3492.6158122606494;3540.7167426606325;3606.6573675500786;3669.541307336583;56315;57308;57590.13614795781;57709.42290577041;58068;50372.748136259084;50780.746096269286;51169.23246151311;51356.22965655518;51748.74125629423;45398.77300613476;45448.54551454509;45868.99999999933;46086.539134608895;46403;7201.855962880818;7287.489875708649;7832.451728378959;7854.567998760123;7957.204279571996;32523.512147317335;32911.67088329086;33443.1639209012;33491.66508334885;36579.085522862144;43228.56771432245;43512.78243608762;43979.78010109929;44086;44088.33867491926;9517.52412379392;9535.284853636143;9711.951440242754;9899.851502227328;10105.696829095139;11252.943735281271;11384.601538946097;11411.201215914807;11433.912918093964;11548.191626586058;10298.691039268833;10458.738531536468;10631.820476802392;10697.197710171613;10789.676309710721;9590.904090959;10498.212634052325;10639.734006649896;10783.460826958777;11021.779564408507;10198.898011019795;10384.221183411124;10556.208284378548;10624;10688.144948404264;8531.573421329032;8553.315734741082;8777.341699372444;8781.429207101519;8846.0711625281;7751.92248077512;7895.368370530229;7992.240737129963;8216.404886561955;8809.955950220208 05:25:50 INFO - PROCESS | 555 | __end_tp_report 05:25:50 INFO - PROCESS | 555 | __start_cc_report 05:25:50 INFO - PROCESS | 555 | _x_x_mozilla_cycle_collect,751 05:25:50 INFO - PROCESS | 555 | __end_cc_report 05:25:50 INFO - PROCESS | 555 | __startTimestamp1455542750690__endTimestamp 05:25:50 INFO - PROCESS | 555 | 05:25:50 INFO - PROCESS | 555 | ------- Summary: start ------- 05:25:50 INFO - PROCESS | 555 | Number of tests: 6 05:25:50 INFO - PROCESS | 555 | 05:25:50 INFO - PROCESS | 555 | [#0] dojo.html Cycles:165 Average:5150.04 Median:5362.81 stddev:556.75 (10.4%) stddev-sans-first:534.20 05:25:50 INFO - PROCESS | 555 | Values: 3078.2 3131.3 3172.0 3174.5 3201.3 5084.8 5091.0 5151.4 5156.9 5183.6 5090.3 5105.7 5136.1 5150.3 5151.2 4663.5 4670.6 4723.6 4771.6 4796.8 4679.4 4722.6 4735.4 4772.0 4853.1 4686.1 4727.0 4728.8 4757.6 4773.1 4678.6 4680.0 4690.3 4696.1 4732.8 4651.2 4661.4 4665.6 4667.1 4714.2 5085.5 5105.2 5114.2 5127.3 5129.7 5604.2 5623.5 5629.3 5629.9 5669.6 5521.6 5557.6 5621.9 5672.3 5678.1 5178.6 5199.2 5202.1 5213.5 5236.3 5612.0 5621.8 5629.6 5630.4 5636.5 5362.8 5389.0 5483.6 5488.4 5523.7 5593.3 5607.8 5611.6 5615.7 5623.0 5425.7 5546.6 5565.5 5569.0 5592.4 5463.5 5508.2 5513.9 5542.3 5607.6 4315.8 4335.7 4342.5 4357.7 4374.5 3836.3 3855.6 3858.3 3882.3 3902.9 5025.2 5096.6 5106.3 5148.5 5179.9 5564.1 5565.4 5566.1 5566.4 5581.9 5093.0 5161.2 5171.1 5179.2 5208.0 4665.2 4725.6 4761.4 4778.1 4823.3 5673.9 5697.9 5702.9 5705.2 5707.5 5383.7 5530.3 5532.5 5537.4 5584.4 5652.8 5678.6 5720.5 5744.8 5789.7 5420.1 5421.9 5427.1 5429.5 5430.3 5454.6 5474.8 5527.5 5572.6 5572.6 5368.5 5369.9 5421.3 5434.3 5475.7 5374.6 5393.3 5394.4 5402.1 5441.6 5235.3 5319.5 5328.0 5351.3 5377.0 5413.5 5464.5 5465.3 5483.3 5519.4 5356.7 5358.7 5359.9 5363.5 5363.7 05:25:50 INFO - PROCESS | 555 | 05:25:50 INFO - PROCESS | 555 | [#1] ext.html Cycles:180 Average:44563.25 Median:29140.56 stddev:77401.18 (265.6%) stddev-sans-first:77547.58 05:25:50 INFO - PROCESS | 555 | Values: 492.2 513.9 543.5 557.5 558.0 25481.2 35895.5 36283.5 36325.5 36379.3 38384.8 38904.4 39043.8 39099.2 39159.8 7474.4 7606.5 8391.5 8609.5 8618.4 9895.2 10159.9 10178.2 10179.2 10187.2 10056.5 10247.6 10261.1 10261.8 10263.1 10052.2 10157.4 10165.5 10172.4 10176.8 10050.5 10200.0 10208.3 10477.9 10518.6 35918.8 36261.8 36274.3 36382.6 36442.8 2869.0 2957.4 3231.7 3481.2 3688.4 27313.9 27359.2 27479.7 27763.7 28088.7 3876.2 3940.3 3984.1 3985.3 3992.6 268036.0 268983.0 269990.0 270141.0 273968.6 56972.1 58014.0 58017.0 58037.4 58097.7 51383.7 51397.0 51583.5 51703.7 51725.5 15411.9 15451.2 15479.1 15559.4 15582.9 11665.4 11924.3 11959.1 12099.8 12138.4 18298.0 18565.9 18684.3 18709.8 18818.9 6158.9 6267.4 6298.5 6303.6 6391.2 879.9 898.6 913.0 937.5 989.5 26189.7 26402.5 26421.3 26504.2 26771.6 919.2 990.1 1012.6 1102.8 1155.4 12479.6 12631.9 13855.6 14024.9 14311.4 304788.0 310333.0 310715.0 311206.0 311967.0 46359.3 46604.8 46649.8 46660.0 46666.0 1198.6 1274.6 1284.9 1331.1 1347.2 24889.5 25119.9 26239.2 27049.6 27514.6 41408.6 41821.0 41834.4 41837.0 41858.4 284893.0 289372.0 290645.0 291772.0 361307.0 27639.7 27898.3 27956.3 27982.4 27997.2 32271.5 42172.8 42966.6 43041.1 44320.3 27641.9 27672.2 27675.9 28146.0 28694.4 29292.4 29356.3 29556.4 29815.0 35332.6 28652.9 29115.0 29166.1 29230.6 29531.6 25901.9 26241.5 32057.0 33196.5 33520.5 20742.9 20833.9 20957.6 21031.8 21136.9 05:25:50 INFO - PROCESS | 555 | 05:25:50 INFO - PROCESS | 555 | [#2] jquery.html Cycles:180 Average:26130.33 Median:41646.19 stddev:84001.52 (201.7%) stddev-sans-first:84214.86 05:25:50 INFO - PROCESS | 555 | Values: 350.6 358.6 363.4 372.5 373.6 13121.8 13611.9 16160.7 16299.7 16701.6 14055.0 14061.6 15697.0 15960.2 15962.0 5280.0 5341.9 5453.4 5453.5 5462.1 3705.8 5269.2 5398.9 5469.2 5487.9 5341.2 5378.5 5445.4 5471.3 5484.8 5434.5 5436.3 5444.8 5447.5 5450.3 5140.9 5181.6 5231.1 5253.6 5256.5 11995.6 12190.8 12878.8 19284.2 19317.5 2001.2 2046.4 2069.7 2169.8 2664.0 8830.9 9294.0 9392.6 9404.1 9418.2 1700.8 1720.8 1766.9 1770.2 1785.9 59743.7 60442.0 60493.7 61068.0 61355.7 10030.5 10170.3 10173.2 10179.9 10188.2 12983.9 13729.7 13747.9 13753.4 13760.9 7125.2 7272.5 7467.7 7504.4 7744.2 7534.8 7537.9 7540.1 7549.0 7581.5 4061.6 4366.4 4409.8 4458.1 4466.3 1704.6 1728.5 1738.1 1779.2 1849.8 728.8 729.1 747.1 810.3 838.6 14750.7 14907.2 15061.5 15130.5 15233.5 364.1 373.4 385.4 403.6 427.5 4812.8 4994.1 5013.2 5155.1 5223.0 348178.0 530860.0 531819.0 558519.0 567990.0 50378.5 62914.7 67240.3 67255.0 69458.0 504.6 512.2 512.3 512.8 514.0 10544.7 14024.5 14824.7 15082.3 15134.5 33181.0 33189.7 34020.7 34478.1 35491.5 40173.8 41610.0 41682.4 41899.6 42051.4 7540.4 7559.9 7564.9 7637.1 7667.6 10711.5 11467.7 11810.5 11952.9 12055.7 9900.7 10053.6 10244.8 10455.1 10573.5 10153.3 10382.4 10417.3 10465.9 10698.2 7795.6 10293.2 10560.0 10630.7 10712.1 7307.3 7393.1 7398.7 7401.7 7540.2 9905.4 10227.5 10276.4 10440.0 10503.8 05:25:50 INFO - PROCESS | 555 | 05:25:50 INFO - PROCESS | 555 | [#3] mootools.html Cycles:180 Average:5442.66 Median:6275.95 stddev:2868.68 (45.7%) stddev-sans-first:2859.11 05:25:50 INFO - PROCESS | 555 | Values: 1213.8 1276.4 1306.5 1307.5 1482.6 7101.7 7614.5 7799.5 7807.5 7807.6 7815.2 7885.8 7927.2 7958.9 7965.8 1933.9 1973.9 2219.0 2234.9 2240.3 2174.9 2232.4 2233.7 2236.2 2238.3 2178.4 2207.4 2238.6 2240.3 2241.5 2116.9 2130.0 2199.5 2202.9 2204.3 2228.9 2246.8 2251.5 2252.0 2264.0 7960.5 8011.1 8016.6 8019.2 8024.8 4751.5 4856.8 4928.2 4931.5 4946.9 3165.0 3173.5 3253.4 3299.7 3311.1 990.8 1005.7 1035.8 1079.3 1112.0 11078.4 11081.7 11085.7 11104.9 11110.9 4310.7 4403.3 4451.6 4490.0 4560.7 8299.9 8574.2 8576.3 8583.3 8593.3 4755.7 4797.7 4798.4 4799.0 4803.7 4408.7 4438.1 4441.7 4443.0 4445.3 3295.2 3468.4 3495.6 3504.4 3517.2 1067.8 1100.1 1100.2 1109.5 1125.5 838.6 892.8 1150.8 1184.6 1188.2 7422.7 7433.3 7437.5 7458.6 7471.9 1052.7 1062.5 1072.0 1078.6 1100.6 5807.1 5923.6 5927.6 5928.7 5979.3 9447.6 9465.7 9649.5 9685.5 9776.9 9572.0 9632.8 9640.1 9660.4 9664.7 7324.6 7473.5 7508.6 7547.8 7548.9 6844.1 6917.6 6928.7 6934.5 6946.1 8274.2 8515.3 8556.0 8641.3 8641.8 8762.7 8816.1 8818.6 8877.2 8990.5 6372.7 6481.5 6495.5 6512.8 6515.1 6644.9 7147.5 7343.2 7359.7 7387.3 6746.5 6793.5 6814.4 6974.2 7047.2 6687.2 6860.9 6915.9 6953.3 7003.0 6606.5 6659.7 6670.4 6673.0 6674.0 5988.0 6301.4 6305.1 6313.6 6314.1 6244.4 6271.5 6275.2 6276.7 6288.7 05:25:50 INFO - PROCESS | 555 | 05:25:50 INFO - PROCESS | 555 | [#4] prototype.html Cycles:180 Average:5284.90 Median:5999.80 stddev:1598.22 (26.6%) stddev-sans-first:1559.09 05:25:50 INFO - PROCESS | 555 | Values: 344.4 345.1 345.5 346.3 348.0 5832.3 5890.4 5947.8 5996.2 6008.3 5695.0 5818.9 5824.8 5827.7 5843.7 4585.0 4586.0 4587.4 4596.4 4602.5 4361.3 4458.9 4550.5 4589.5 4606.3 4498.9 4522.5 4541.6 4552.4 4554.9 4554.3 4561.8 4563.6 4563.8 4567.5 4020.6 4026.4 4027.3 4029.4 4030.4 5503.8 5554.0 5615.6 5667.1 5681.9 5255.6 5256.1 5258.6 5263.7 5264.5 5971.0 6315.6 6323.5 6324.4 6325.0 4241.6 4317.2 4331.0 4353.8 4366.3 6491.9 6539.0 6549.8 6557.8 6559.4 4445.4 4454.6 4458.1 4464.1 4467.5 4437.1 4514.2 4526.1 4527.4 4546.2 5215.1 5226.7 5227.9 5230.4 5234.5 6310.9 6314.6 6318.9 6320.1 6321.6 1577.3 1598.4 1598.9 1601.3 1602.8 1051.0 1058.3 1072.8 1080.5 1099.1 6011.1 6014.3 6014.6 6022.5 6024.7 6501.3 6511.7 6514.6 6518.2 6519.0 5904.0 6003.4 6004.1 6006.8 6008.4 3451.7 3510.2 3518.1 3522.7 3526.6 6778.5 6782.7 6784.8 6786.0 6790.2 6666.0 6667.4 6669.0 6675.8 6677.1 6555.8 6740.6 6760.8 6768.9 6769.2 6271.5 6470.8 6507.3 6521.7 6526.8 6484.8 6495.0 6506.3 6515.3 6529.0 6840.9 6854.1 6854.9 6856.1 6858.9 4366.0 4478.5 4482.1 4483.6 4489.5 6575.3 6576.5 6582.7 6601.7 6662.7 6362.3 6377.9 6392.4 6392.5 6393.7 6216.1 6321.7 6340.1 6360.7 6412.7 6292.7 6298.2 6302.5 6302.6 6306.4 6446.1 6453.9 6455.4 6456.4 6456.7 6055.8 6239.8 6306.5 6306.7 6315.2 05:25:50 INFO - PROCESS | 555 | 05:25:50 INFO - PROCESS | 555 | [#5] yui.html Cycles:180 Average:13313.35 Median:50576.75 stddev:15828.62 (31.3%) stddev-sans-first:15844.21 05:25:50 INFO - PROCESS | 555 | Values: 595.9 707.9 709.1 730.0 732.9 12574.9 12881.1 12890.4 12894.7 12911.6 13610.2 13857.4 13920.9 13927.4 13962.5 639.3 651.9 799.5 804.1 805.3 767.7 774.3 780.0 782.5 783.4 829.9 830.6 832.6 832.6 847.7 656.5 796.5 823.8 830.3 831.9 613.3 617.2 617.2 617.7 619.0 12475.9 12513.6 12516.2 12547.7 12568.4 11519.5 12170.8 12358.3 12469.1 12705.7 9702.5 9779.0 9963.4 10039.9 10081.6 3524.6 3530.2 3549.7 3554.3 3556.2 46658.3 46925.8 46950.8 47692.3 47710.3 9601.0 9738.6 9768.1 10026.1 10060.9 16308.3 16485.6 16494.9 16538.9 16614.0 7460.2 7547.8 7581.2 7591.8 7706.9 4006.8 4054.0 4079.3 4187.9 4286.1 2921.5 2955.0 2958.7 2960.4 3058.1 552.0 565.2 573.0 573.4 583.1 514.5 542.3 559.6 578.3 582.2 7130.9 7395.5 7497.3 7511.3 7606.2 496.2 532.5 580.0 580.3 590.6 3380.3 3492.6 3540.7 3606.7 3669.5 56315.0 57308.0 57590.1 57709.4 58068.0 50372.7 50780.7 51169.2 51356.2 51748.7 45398.8 45448.5 45869.0 46086.5 46403.0 7201.9 7287.5 7832.5 7854.6 7957.2 32523.5 32911.7 33443.2 33491.7 36579.1 43228.6 43512.8 43979.8 44086.0 44088.3 9517.5 9535.3 9712.0 9899.9 10105.7 11252.9 11384.6 11411.2 11433.9 11548.2 10298.7 10458.7 10631.8 10697.2 10789.7 9590.9 10498.2 10639.7 10783.5 11021.8 10198.9 10384.2 10556.2 10624.0 10688.1 8531.6 8553.3 8777.3 8781.4 8846.1 7751.9 7895.4 7992.2 8216.4 8810.0 05:25:50 INFO - PROCESS | 555 | -------- Summary: end -------- 05:25:50 INFO - PROCESS | 555 | 05:25:51 INFO - TEST-INFO | 555: exit 0 05:25:51 INFO - TEST-OK | dromaeo_css | took 1113536ms 05:25:51 INFO - TEST-START | kraken 05:25:51 INFO - operating with platform_type : linux_ 05:25:51 INFO - Initialising browser for kraken test... 05:25:51 INFO - TEST-INFO | started process 744 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpvPPaRH/profile http://localhost:44874/getInfo.html) 05:25:55 INFO - PROCESS | 744 | __metrics Screen width/height:1600/1200 05:25:55 INFO - PROCESS | 744 | colorDepth:24 05:25:55 INFO - PROCESS | 744 | Browser inner width/height: 1024/697 05:25:55 INFO - PROCESS | 744 | __metrics 05:25:56 INFO - PROCESS | 744 | JavaScript error: resource://app/modules/WebappManager.jsm, line 48: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 05:25:56 INFO - PROCESS | 744 | JavaScript error: resource://gre/modules/IndexedDBHelper.jsm, line 138: UnknownError: The operation failed for reasons unrelated to the database itself and not covered by any other error code. 05:25:57 INFO - TEST-INFO | 744: exit 0 05:25:57 INFO - Browser initialized. 05:25:57 INFO - Running cycle 1/1 for kraken test... 05:25:57 INFO - TEST-INFO | started process 835 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpvPPaRH/profile -tp file:/builds/slave/test-pgo/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 05:26:09 INFO - PROCESS | 835 | RSS: Main: 150163456 05:26:09 INFO - PROCESS | 835 | 05:26:11 INFO - PROCESS | 835 | Cycle 1(1): loaded http://localhost:44874/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:44874/tests/kraken/driver.html?testName=audio-beat-detection) 05:26:12 INFO - PROCESS | 835 | RSS: Main: 192315392 05:26:12 INFO - PROCESS | 835 | 05:26:14 INFO - PROCESS | 835 | Cycle 1(1): loaded http://localhost:44874/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:44874/tests/kraken/driver.html?testName=audio-dft) 05:26:15 INFO - PROCESS | 835 | RSS: Main: 183910400 05:26:15 INFO - PROCESS | 835 | 05:26:18 INFO - PROCESS | 835 | Cycle 1(1): loaded http://localhost:44874/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:44874/tests/kraken/driver.html?testName=audio-fft) 05:26:18 INFO - PROCESS | 835 | RSS: Main: 166588416 05:26:18 INFO - PROCESS | 835 | 05:26:20 INFO - PROCESS | 835 | Cycle 1(1): loaded http://localhost:44874/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:44874/tests/kraken/driver.html?testName=audio-oscillator) 05:26:21 INFO - PROCESS | 835 | RSS: Main: 167329792 05:26:21 INFO - PROCESS | 835 | 05:26:23 INFO - PROCESS | 835 | Cycle 1(1): loaded http://localhost:44874/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:44874/tests/kraken/driver.html?testName=imaging-gaussian-blur) 05:26:24 INFO - PROCESS | 835 | RSS: Main: 169734144 05:26:24 INFO - PROCESS | 835 | 05:26:27 INFO - PROCESS | 835 | Cycle 1(1): loaded http://localhost:44874/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:44874/tests/kraken/driver.html?testName=imaging-darkroom) 05:26:27 INFO - PROCESS | 835 | RSS: Main: 170819584 05:26:27 INFO - PROCESS | 835 | 05:26:31 INFO - PROCESS | 835 | Cycle 1(1): loaded http://localhost:44874/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:44874/tests/kraken/driver.html?testName=imaging-desaturate) 05:26:31 INFO - PROCESS | 835 | RSS: Main: 170373120 05:26:31 INFO - PROCESS | 835 | 05:26:34 INFO - PROCESS | 835 | Cycle 1(1): loaded http://localhost:44874/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:44874/tests/kraken/driver.html?testName=json-parse-financial) 05:26:35 INFO - PROCESS | 835 | RSS: Main: 169521152 05:26:35 INFO - PROCESS | 835 | 05:26:36 INFO - PROCESS | 835 | Cycle 1(1): loaded http://localhost:44874/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:44874/tests/kraken/driver.html?testName=json-stringify-tinderbox) 05:26:37 INFO - PROCESS | 835 | RSS: Main: 182575104 05:26:37 INFO - PROCESS | 835 | 05:26:39 INFO - PROCESS | 835 | Cycle 1(1): loaded http://localhost:44874/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:44874/tests/kraken/driver.html?testName=stanford-crypto-aes) 05:26:39 INFO - PROCESS | 835 | RSS: Main: 180170752 05:26:39 INFO - PROCESS | 835 | 05:26:41 INFO - PROCESS | 835 | Cycle 1(1): loaded http://localhost:44874/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:44874/tests/kraken/driver.html?testName=stanford-crypto-ccm) 05:26:42 INFO - PROCESS | 835 | RSS: Main: 196468736 05:26:42 INFO - PROCESS | 835 | 05:26:44 INFO - PROCESS | 835 | Cycle 1(1): loaded http://localhost:44874/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:44874/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 05:26:45 INFO - PROCESS | 835 | RSS: Main: 199086080 05:26:45 INFO - PROCESS | 835 | 05:26:48 INFO - PROCESS | 835 | Cycle 1(1): loaded http://localhost:44874/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:44874/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 05:26:48 INFO - PROCESS | 835 | RSS: Main: 198041600 05:26:48 INFO - PROCESS | 835 | 05:26:50 INFO - PROCESS | 835 | Cycle 1(1): loaded http://localhost:44874/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:44874/tests/kraken/driver.html?testName=ai-astar) 05:26:50 INFO - PROCESS | 835 | RSS: Main: 260595712 05:26:50 INFO - PROCESS | 835 | 05:26:50 INFO - PROCESS | 835 | __start_tp_report 05:26:50 INFO - PROCESS | 835 | _x_x_mozilla_page_load 05:26:50 INFO - PROCESS | 835 | _x_x_mozilla_page_load_details 05:26:50 INFO - PROCESS | 835 | |i|pagename|runs| 05:26:50 INFO - PROCESS | 835 | |0;ai-astar;111;111;106;111;111;111;101;110;110;109 05:26:50 INFO - PROCESS | 835 | |1;audio-beat-detection;154;126;154;166;126;150;161;130;173;124 05:26:50 INFO - PROCESS | 835 | |2;audio-dft;164;164;165;163;164;163;163;166;164;165 05:26:50 INFO - PROCESS | 835 | |3;audio-fft;74;73;94;96;73;74;74;133;117;73 05:26:50 INFO - PROCESS | 835 | |4;audio-oscillator;95;97;138;96;96;98;148;96;96;143 05:26:50 INFO - PROCESS | 835 | |5;imaging-gaussian-blur;119;114;115;115;115;115;115;114;115;115 05:26:50 INFO - PROCESS | 835 | |6;imaging-darkroom;146;145;145;145;146;145;145;146;145;145 05:26:50 INFO - PROCESS | 835 | |7;imaging-desaturate;95;96;96;95;96;96;96;97;97;97 05:26:50 INFO - PROCESS | 835 | |8;json-parse-financial;58;59;58;57;55;58;59;68;57;53 05:26:50 INFO - PROCESS | 835 | |9;json-stringify-tinderbox;67;67;67;67;68;67;67;67;68;68 05:26:50 INFO - PROCESS | 835 | |10;stanford-crypto-aes;85;82;84;85;85;91;85;85;84;85 05:26:50 INFO - PROCESS | 835 | |11;stanford-crypto-ccm;116;125;116;122;116;115;121;116;123;134 05:26:50 INFO - PROCESS | 835 | |12;stanford-crypto-pbkdf2;153;142;164;140;149;144;157;153;151;153 05:26:50 INFO - PROCESS | 835 | |13;stanford-crypto-sha256-iterative;71;68;72;68;68;67;68;69;69;67 05:26:50 INFO - PROCESS | 835 | __end_tp_report 05:26:50 INFO - PROCESS | 835 | __start_cc_report 05:26:50 INFO - PROCESS | 835 | _x_x_mozilla_cycle_collect,971 05:26:50 INFO - PROCESS | 835 | __end_cc_report 05:26:50 INFO - PROCESS | 835 | __startTimestamp1455542810617__endTimestamp 05:26:50 INFO - PROCESS | 835 | 05:26:50 INFO - PROCESS | 835 | ------- Summary: start ------- 05:26:50 INFO - PROCESS | 835 | Number of tests: 14 05:26:50 INFO - PROCESS | 835 | 05:26:50 INFO - PROCESS | 835 | [#0] ai-astar Cycles:10 Average:109.10 Median:111.00 stddev:3.25 (2.9%) stddev-sans-first:3.37 05:26:50 INFO - PROCESS | 835 | Values: 111.0 111.0 106.0 111.0 111.0 111.0 101.0 110.0 110.0 109.0 05:26:50 INFO - PROCESS | 835 | 05:26:50 INFO - PROCESS | 835 | [#1] audio-beat-detection Cycles:10 Average:146.40 Median:154.00 stddev:18.37 (11.9%) stddev-sans-first:19.28 05:26:50 INFO - PROCESS | 835 | Values: 154.0 126.0 154.0 166.0 126.0 150.0 161.0 130.0 173.0 124.0 05:26:50 INFO - PROCESS | 835 | 05:26:50 INFO - PROCESS | 835 | [#2] audio-dft Cycles:10 Average:164.10 Median:164.00 stddev:0.99 (0.6%) stddev-sans-first:1.05 05:26:50 INFO - PROCESS | 835 | Values: 164.0 164.0 165.0 163.0 164.0 163.0 163.0 166.0 164.0 165.0 05:26:50 INFO - PROCESS | 835 | 05:26:50 INFO - PROCESS | 835 | [#3] audio-fft Cycles:10 Average:88.10 Median:74.00 stddev:21.68 (29.3%) stddev-sans-first:22.38 05:26:50 INFO - PROCESS | 835 | Values: 74.0 73.0 94.0 96.0 73.0 74.0 74.0 133.0 117.0 73.0 05:26:50 INFO - PROCESS | 835 | 05:26:50 INFO - PROCESS | 835 | [#4] audio-oscillator Cycles:10 Average:110.30 Median:96.00 stddev:22.70 (23.6%) stddev-sans-first:23.39 05:26:50 INFO - PROCESS | 835 | Values: 95.0 97.0 138.0 96.0 96.0 98.0 148.0 96.0 96.0 143.0 05:26:50 INFO - PROCESS | 835 | 05:26:50 INFO - PROCESS | 835 | [#5] imaging-gaussian-blur Cycles:10 Average:115.20 Median:115.00 stddev:1.40 (1.2%) stddev-sans-first:0.44 05:26:50 INFO - PROCESS | 835 | Values: 119.0 114.0 115.0 115.0 115.0 115.0 115.0 114.0 115.0 115.0 05:26:50 INFO - PROCESS | 835 | 05:26:50 INFO - PROCESS | 835 | [#6] imaging-darkroom Cycles:10 Average:145.30 Median:145.00 stddev:0.48 (0.3%) stddev-sans-first:0.44 05:26:50 INFO - PROCESS | 835 | Values: 146.0 145.0 145.0 145.0 146.0 145.0 145.0 146.0 145.0 145.0 05:26:50 INFO - PROCESS | 835 | 05:26:50 INFO - PROCESS | 835 | [#7] imaging-desaturate Cycles:10 Average:96.10 Median:96.00 stddev:0.74 (0.8%) stddev-sans-first:0.67 05:26:50 INFO - PROCESS | 835 | Values: 95.0 96.0 96.0 95.0 96.0 96.0 96.0 97.0 97.0 97.0 05:26:50 INFO - PROCESS | 835 | 05:26:50 INFO - PROCESS | 835 | [#8] json-parse-financial Cycles:10 Average:58.20 Median:58.00 stddev:3.91 (6.7%) stddev-sans-first:4.15 05:26:50 INFO - PROCESS | 835 | Values: 58.0 59.0 58.0 57.0 55.0 58.0 59.0 68.0 57.0 53.0 05:26:50 INFO - PROCESS | 835 | 05:26:50 INFO - PROCESS | 835 | [#9] json-stringify-tinderbox Cycles:10 Average:67.30 Median:67.00 stddev:0.48 (0.7%) stddev-sans-first:0.50 05:26:50 INFO - PROCESS | 835 | Values: 67.0 67.0 67.0 67.0 68.0 67.0 67.0 67.0 68.0 68.0 05:26:50 INFO - PROCESS | 835 | 05:26:50 INFO - PROCESS | 835 | [#10] stanford-crypto-aes Cycles:10 Average:85.10 Median:85.00 stddev:2.28 (2.7%) stddev-sans-first:2.42 05:26:50 INFO - PROCESS | 835 | Values: 85.0 82.0 84.0 85.0 85.0 91.0 85.0 85.0 84.0 85.0 05:26:50 INFO - PROCESS | 835 | 05:26:50 INFO - PROCESS | 835 | [#11] stanford-crypto-ccm Cycles:10 Average:120.40 Median:121.50 stddev:5.99 (4.9%) stddev-sans-first:6.13 05:26:50 INFO - PROCESS | 835 | Values: 116.0 125.0 116.0 122.0 116.0 115.0 121.0 116.0 123.0 134.0 05:26:50 INFO - PROCESS | 835 | 05:26:50 INFO - PROCESS | 835 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:150.60 Median:153.00 stddev:7.23 (4.7%) stddev-sans-first:7.62 05:26:50 INFO - PROCESS | 835 | Values: 153.0 142.0 164.0 140.0 149.0 144.0 157.0 153.0 151.0 153.0 05:26:50 INFO - PROCESS | 835 | 05:26:50 INFO - PROCESS | 835 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:68.70 Median:68.50 stddev:1.64 (2.4%) stddev-sans-first:1.51 05:26:50 INFO - PROCESS | 835 | Values: 71.0 68.0 72.0 68.0 68.0 67.0 68.0 69.0 69.0 67.0 05:26:50 INFO - PROCESS | 835 | -------- Summary: end -------- 05:26:50 INFO - PROCESS | 835 | 05:26:51 INFO - TEST-INFO | 835: exit 0 05:26:51 INFO - TEST-OK | kraken | took 60227ms 05:26:51 INFO - SUITE-END | took 1173s 05:26:51 INFO - Completed test suite (00:19:33) 05:26:51 INFO - Working with test: dromaeo_css 05:26:51 INFO - Generating results file: dromaeo_css 05:26:51 INFO - Working with test: kraken 05:26:51 INFO - Generating results file: kraken 05:26:51 INFO - javascript benchmark 05:26:51 INFO - Posting result 0 of 2 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 05:26:51 INFO - process_Request line: dromaeo_css graph.html#tests=[[72,64,35]] 05:26:51 INFO - process_Request line: dromaeo_css 6623.68 graph.html#tests=[[72,64,35]] 05:26:51 INFO - Posting result 1 of 2 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 05:26:51 INFO - process_Request line: kraken 1524.90 graph.html#tests=[[232,64,35]] 05:26:51 INFO - RETURN: dromaeo_css: 6623.68 05:26:51 INFO - RETURN: kraken: 1524.90 05:26:51 INFO - javascript benchmark 05:26:51 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"lowerIsBetter": false, "subtests": [{"lowerIsBetter": false, "replicates": [3078.1996680862976, 3131.326764745579, 3171.9682803171977, 3174.5396917446956, 3201.3117179806345, 5084.79660813567, 5091.032703786278, 5151.381834179899, 5156.948430515698, 5183.559397451221, 5090.287359769635, 5105.668131571455, 5136.075506408845, 5150.27896094547, 5151.175811870102, 4663.463701674317, 4670.626349892001, 4723.551262630044, 4771.570558649721, 4796.784144713479, 4679.3682852814945, 4722.5513576210205, 4735.360726301939, 4772.0, 4853.102176097434, 4686.133065382898, 4727.0, 4728.787204575768, 4757.619390448755, 4773.093112308685, 4678.649101317381, 4680.040591678698, 4690.296455531663, 4696.060787842411, 4732.787024583902, 4651.209294419923, 4661.417322834645, 4665.5567721066445, 4667.089917466095, 4714.151452738506, 5085.466026067246, 5105.2086926526445, 5114.181730923035, 5127.307813445174, 5129.666571672829, 5604.1593760935775, 5623.49388555028, 5629.268195134648, 5629.887402251973, 5669.603127781057, 5521.585881058896, 5557.5831812614215, 5621.887562248773, 5672.319321681383, 5678.063119585264, 5178.559822415099, 5199.2461093141665, 5202.0896343140175, 5213.530782229617, 5236.293100431393, 5612.017896868032, 5621.80323688669, 5629.577781666309, 5630.40880707528, 5636.464535869086, 5362.812301569426, 5388.9730551347775, 5483.588730845203, 5488.4237155098135, 5523.6685798852195, 5593.300837395325, 5607.80372686954, 5611.6352437091455, 5615.6630602164005, 5623.044082505984, 5425.674459532441, 5546.556275498031, 5565.471280228372, 5569.0, 5592.356878958891, 5463.535599474009, 5508.173773933942, 5513.917291240635, 5542.334919809648, 5607.551395888319, 4315.784210789448, 4335.674824388184, 4342.5006124296115, 4357.694961352675, 4374.4531933508315, 3836.3094642963974, 3855.63371479709, 3858.3247931611854, 3882.281777871103, 3902.8829135125993, 5025.221090730869, 5096.61775366849, 5106.259592359087, 5148.536631703089, 5179.922301165486, 5564.054110801174, 5565.3599836019375, 5566.081596536607, 5566.35986861508, 5581.944180558224, 5093.0, 5161.174212126117, 5171.069207542679, 5179.22311653255, 5208.0365132450615, 4665.230237010923, 4725.64557658177, 4761.35721677576, 4778.068276686013, 4823.27650852375, 5673.858153546194, 5697.914531282034, 5702.942970570324, 5705.22979397776, 5707.543396528268, 5383.67697938125, 5530.312865117409, 5532.529734972572, 5537.418571049981, 5584.385717570983, 5652.7738890443925, 5678.630888992202, 5720.48515633595, 5744.770209191585, 5789.681567513827, 5420.078586640359, 5421.864453388697, 5427.050266203478, 5429.484199001088, 5430.294061771944, 5454.563634909118, 5474.835754927359, 5527.474889885454, 5572.637778544382, 5572.637778544382, 5368.543673787772, 5369.919451208313, 5421.295231619864, 5434.347878254634, 5475.67145971243, 5374.57003439716, 5393.298871146726, 5394.406615272238, 5402.081646120248, 5441.564674826083, 5235.319408477026, 5319.521243088141, 5328.0, 5351.277577526984, 5376.973115134399, 5413.458654134555, 5464.453554644504, 5465.262189604353, 5483.341998960151, 5519.365272993497, 5356.678599284055, 5358.705271210121, 5359.892802144013, 5363.490468405495, 5363.704996225245], "unit": "score", "name": "dojo.html", "value": 5115.0744293628195}, {"lowerIsBetter": false, "replicates": [492.2198315669663, 513.9331886854714, 543.4999800183829, 557.4787573618667, 557.9788986155336, 25481.235562933118, 35895.46156807647, 36283.45574816373, 36325.455118173246, 36379.27241455169, 38384.80807595958, 38904.416433753446, 39043.80478097613, 39099.21801563967, 39159.80420097896, 7474.402047836187, 7606.543607383574, 8391.496510209407, 8609.483430994129, 8618.396712230146, 9895.208383329316, 10159.898401016006, 10178.18574514037, 10179.185665146808, 10187.235957303232, 10056.547455364525, 10247.590096396136, 10261.076503114718, 10261.794764104714, 10263.076323130917, 10052.195824334036, 10157.441340726256, 10165.542550585167, 10172.44051577163, 10176.796464070714, 10050.547725352377, 10200.030997055268, 10208.336458130272, 10477.9476102619, 10518.579256829718, 35918.82040589806, 36261.81869090664, 36274.27451450956, 36382.63617363819, 36442.81778591117, 2868.956965645517, 2957.393734284488, 3231.692989166049, 3481.216726236602, 3688.4098544232793, 27313.86343068272, 27359.179224623294, 27479.725202748115, 27763.722362776316, 28088.719112808816, 3876.2441323941844, 3940.2513522430645, 3984.083660758042, 3985.322495175798, 3992.640662340403, 268036.0, 268983.0, 269990.0, 270141.0, 273968.6301568499, 56972.14541781876, 58014.0, 58017.0, 58037.41962580405, 58097.70951145302, 51383.7430812851, 51397.0, 51583.48416515862, 51703.74148129235, 51725.48274517206, 15411.922940385226, 15451.227438628024, 15479.148646824307, 15559.377624895104, 15582.922085389728, 11665.35840528779, 11924.284542927453, 11959.103067269989, 12099.818502722466, 12138.393080345948, 18298.0, 18565.907170464063, 18684.34604788853, 18709.81290187108, 18818.90590547066, 6158.938410615926, 6267.4045965633195, 6298.464630506367, 6303.581694118787, 6391.201099862517, 879.9340049496313, 898.595631965618, 913.0048247410355, 937.5406051034944, 989.475577943691, 26189.73810261911, 26402.471950561267, 26421.33946651349, 26504.204873853814, 26771.598426023626, 919.2370332623906, 990.1385794358954, 1012.64051261801, 1102.7573933734566, 1155.3530023187043, 12479.56321528742, 12631.936840315924, 13855.584332470042, 14024.859751402355, 14311.35598898052, 304788.0, 310333.0, 310715.0, 311206.0, 311967.0, 46359.30461043087, 46604.7669761649, 46649.7667511667, 46660.0, 46666.0, 1198.6044605280238, 1274.6048724895313, 1284.9290196430352, 1331.10150648312, 1347.2455424961856, 24889.50220995534, 25119.87440062861, 26239.212823615322, 27049.59425608578, 27514.587281190397, 41408.58591414168, 41821.0, 41834.37248441337, 41837.0, 41858.37212441755, 284893.0, 289372.0, 290645.0, 291772.0, 361307.0, 27639.723602763715, 27898.30254243579, 27956.301092472037, 27982.440351192454, 27997.160085197476, 32271.51592726158, 42172.789136054125, 42966.57033429626, 43041.13917721691, 44320.335194972744, 27641.861790690917, 27672.16983490418, 27675.86162069177, 28146.01488947877, 28694.426111477234, 29292.41415171642, 29356.266093347836, 29556.408871822012, 29815.0, 35332.64667353396, 28652.85673571702, 29115.0, 29166.125016249545, 29230.561541577317, 29531.55702664505, 25901.870490647427, 26241.475170496866, 32057.0, 33196.50205246972, 33520.49719254262, 20742.896285518476, 20833.89583052075, 20957.58084838264, 21031.789682102983, 21136.894315528323], "unit": "score", "name": "ext.html", "value": 17472.540502761745}, {"lowerIsBetter": false, "replicates": [350.6458476938293, 358.5786700626763, 363.3677401321701, 372.4878292348021, 373.5778570215656, 13121.803172952414, 13611.93194034031, 16160.676786464264, 16299.674006519863, 16701.582460438494, 14055.016148869558, 14061.578152655436, 15697.0, 15960.201989900517, 15962.0, 5279.973600131994, 5341.946580534183, 5453.400125986138, 5453.481919217687, 5462.126059830428, 3705.759125656837, 5269.209618557209, 5398.946010539884, 5469.179623056533, 5487.862803429906, 5341.225522299264, 5378.547792096132, 5445.428230035848, 5471.288732464774, 5484.808031718891, 5434.538064264542, 5436.320459942507, 5444.8366549003595, 5447.45525447456, 5450.29146210994, 5140.948590514085, 5181.559567436772, 5231.058409486291, 5253.605979551549, 5256.474352564751, 11995.64013079609, 12190.756184876342, 12878.80681789774, 19284.22863085475, 19317.51706207342, 2001.2495314257153, 2046.4474591860264, 2069.6791997240452, 2169.7721739217473, 2664.027629915067, 8830.911690883073, 9294.0, 9392.62429502819, 9404.106609872051, 9418.152366286999, 1700.7703959965493, 1720.8365205305477, 1766.911654417274, 1770.238797317153, 1785.9374921877802, 59743.70128149375, 60442.0, 60493.6975315125, 61068.0, 61355.693221533606, 10030.548625311878, 10170.288079834341, 10173.186145108373, 10179.898201018043, 10188.184945204513, 12983.935080324538, 13729.725405492034, 13747.931260343634, 13753.449862005607, 13760.93119534396, 7125.216226215112, 7272.454565907472, 7467.701291948261, 7504.399648028145, 7744.225577442211, 7534.811629709301, 7537.924620753723, 7540.057492813398, 7548.962255188689, 7581.469297149257, 4061.634452899253, 4366.388705581221, 4409.845655402046, 4458.08609235106, 4466.307722303049, 1704.6249825038471, 1728.4875733732983, 1738.1135620833466, 1779.1815764748103, 1849.833514983658, 728.806866180452, 729.1323325242944, 747.1072068877639, 810.266708628692, 838.6310023589723, 14750.704985900222, 14907.180105094107, 15061.548153555412, 15130.54608361751, 15233.466828661165, 364.10067134178536, 373.38205270277734, 385.4007019085293, 403.58632401787816, 427.53398795313257, 4812.807487700523, 4994.076095922266, 5013.172826483662, 5155.097857874857, 5223.0, 348178.0, 530860.0, 531819.0, 558519.0, 567990.0, 50378.49621503738, 62914.68542657349, 67240.32759672341, 67255.0, 69458.0, 504.5509496548002, 512.1651707716399, 512.3032675561234, 512.805134049059, 513.9768710408041, 10544.683659490227, 14024.509142179975, 14824.703505930036, 15082.321295541946, 15134.545963621109, 33181.0, 33189.668103318654, 34020.65979340274, 34478.13804654904, 35491.46762798508, 40173.799131004154, 41610.0, 41682.374764379165, 41899.58100418957, 42051.369229462194, 7540.434467415075, 7559.886601700869, 7564.886526701994, 7637.083549973817, 7667.616619168908, 10711.464426778786, 11467.713307167387, 11810.527578896748, 11952.940235298767, 12055.698607534881, 9900.702978910644, 10053.597856085675, 10244.795104098026, 10455.111315538265, 10573.52419141125, 10153.289269751047, 10382.428966406618, 10417.322874013165, 10465.895341046493, 10698.197635177237, 7795.64919578609, 10293.228007899288, 10560.0, 10630.73423164427, 10712.143028557852, 7307.26927307265, 7393.149787774475, 7398.741044063432, 7401.666924988281, 7540.208278130936, 9905.356151850106, 10227.539760710637, 10276.383416995004, 10440.0, 10503.78992420132], "unit": "score", "name": "jquery.html", "value": 7527.007160331904}, {"lowerIsBetter": false, "replicates": [1213.8361321221632, 1276.4000919567802, 1306.4512904580076, 1307.542360173939, 1482.6071091160852, 7101.680424380902, 7614.543127412359, 7799.493032952854, 7807.45347825651, 7807.609619519029, 7815.218478152182, 7885.842283154333, 7927.20727927207, 7958.880616790752, 7965.800854978628, 1933.9323123690674, 1973.9111739971736, 2218.955620887585, 2234.944126396837, 2240.283109404991, 2174.8912554372296, 2232.363776323748, 2233.6984507091497, 2236.194969810867, 2238.2613737466595, 2178.4444966533592, 2207.4371035386034, 2238.608243557379, 2240.283109404991, 2241.529278851443, 2116.8518203725744, 2130.0, 2199.472126689591, 2202.8678279303213, 2204.2505548113636, 2228.8551244169075, 2246.7528571857083, 2251.493413981841, 2251.9887400563057, 2264.049099378265, 7960.522368657841, 8011.118776934532, 8016.559089250089, 8019.2381723736735, 8024.799380015546, 4751.524847515221, 4856.805727770885, 4928.211486162197, 4931.4821943696115, 4946.851594452172, 3165.0, 3173.539836723662, 3253.430649636304, 3299.703026727606, 3311.106001379638, 990.8018396320692, 1005.6580762540772, 1035.7773078788098, 1079.3092420850662, 1112.0165361529607, 11078.390688512129, 11081.72295692598, 11085.667429977113, 11104.944475277573, 11110.888891111066, 4310.698251122391, 4403.339499075164, 4451.621612163002, 4490.0, 4560.726356418625, 8299.875501867476, 8574.185452382013, 8576.313894888393, 8583.313334933191, 8593.312534997185, 4755.738434386142, 4797.664163508521, 4798.4001999750035, 4799.0401919616215, 4803.735794531334, 4408.713433626804, 4438.068005718836, 4441.689081764245, 4442.955570444255, 4445.26653102241, 3295.20914980403, 3468.4103702370153, 3495.598006229265, 3504.351694936445, 3517.2086280586664, 1067.8398240263866, 1100.1254003067581, 1100.2298391126244, 1109.5229051507768, 1125.5047778977223, 838.6351936907465, 892.834825557274, 1150.7640933608757, 1184.620921305174, 1188.2157775867886, 7422.665980030912, 7433.331000210007, 7437.516561423598, 7458.627068646546, 7471.925280747231, 1052.6999805055523, 1062.527175406952, 1072.0458791675414, 1078.6170909327234, 1100.5872797700863, 5807.128930660435, 5923.585349025527, 5927.555433342516, 5928.7332070056955, 5979.252593425822, 9447.574859131355, 9465.716028519155, 9649.469279189572, 9685.467299298465, 9776.902230977741, 9571.952140239255, 9632.807343853083, 9640.132388085107, 9660.420374777535, 9664.661736839176, 7324.560526368328, 7473.476856619985, 7508.587027713528, 7547.811304717426, 7548.886766698504, 6844.076049733222, 6917.550359226634, 6928.688209030505, 6934.514583979073, 6946.097007389007, 8274.172582741678, 8515.27620152294, 8556.016058153393, 8641.308695304235, 8641.783955401166, 8762.685597160476, 8816.074312197126, 8818.603162857815, 8877.20105190536, 8990.460572365679, 6372.681365931778, 6481.546291759721, 6495.480361571157, 6512.772052978123, 6515.120458738199, 6644.867102658017, 7147.499675022698, 7343.2289609590225, 7359.742409015873, 7387.335139837441, 6746.5277430581355, 6793.490488213305, 6814.352636499525, 6974.197967233833, 7047.224805271519, 6687.164104486939, 6860.931390686029, 6915.93084069173, 6953.26990665993, 7003.0, 6606.504512161703, 6659.7003134860015, 6670.39966403026, 6672.966635166793, 6674.0, 5987.970060149672, 6301.40136687014, 6305.085762564494, 6313.589616674902, 6314.116023756769, 6244.406781355764, 6271.498280137487, 6275.184226050585, 6276.717547710273, 6288.717007734572], "unit": "score", "name": "mootools.html", "value": 4431.245725100553}, {"lowerIsBetter": false, "replicates": [344.41277621655064, 345.082081662777, 345.4507333339992, 346.3194822174427, 347.9652034796521, 5832.300123985117, 5890.352061273262, 5947.821565353035, 5996.1605375247445, 6008.279006519213, 5694.971525142369, 5818.941810581893, 5824.825255242339, 5827.708614569276, 5843.678597677137, 4585.037142200125, 4585.9770701146535, 4587.403637527117, 4596.4254468191475, 4602.470715867667, 4361.258586040381, 4458.8885277867985, 4550.522195169509, 4589.5410458954175, 4606.309053641964, 4498.865034048984, 4522.5025247222775, 4541.636669066466, 4552.430946131733, 4554.863354099382, 4554.316852472122, 4561.817527298937, 4563.612092972101, 4563.840265590688, 4567.543245675439, 4020.618041286073, 4026.396040593905, 4027.2952233359047, 4029.4358789769162, 4030.3954406839207, 5503.834884953418, 5553.972230138824, 5615.578831587647, 5667.064934285838, 5681.914771278434, 5255.60582956276, 5256.106461901486, 5258.6318957672975, 5263.710495922723, 5264.499872512105, 5970.97014514929, 6315.621062736204, 6323.462505687022, 6324.399182077741, 6324.968375158141, 4241.618254357092, 4317.15815415994, 4331.047169622678, 4353.84761533348, 4366.323219900921, 6491.93508064918, 6539.0, 6549.836254093638, 6557.803265902078, 6559.409653131241, 4445.377647129404, 4454.57681520255, 4458.063806600585, 4464.1071785643, 4467.508574056851, 4437.134758722018, 4514.187446259705, 4526.117407105583, 4527.388802511685, 4546.249868771615, 5215.113430716788, 5226.660267082703, 5227.947720522746, 5230.37235531731, 5234.476552344811, 6310.9368906311265, 6314.621122732558, 6318.905216421757, 6320.146780184617, 6321.620702757849, 1577.3138684672203, 1598.3606557376909, 1598.9200539972956, 1601.295430010815, 1602.7756114144029, 1050.9894901051046, 1058.2909450668071, 1072.8337107748312, 1080.5245691895698, 1099.1371773158032, 6011.098335249748, 6014.278286605635, 6014.6391216527145, 6022.488088512438, 6024.728887200086, 6501.2523559791225, 6511.674416279167, 6514.57655252407, 6518.152640156844, 6518.967405163039, 5903.970480147572, 6003.429674180946, 6004.099385092184, 6006.759729610854, 6008.369121242294, 3451.741119416054, 3510.210202704371, 3518.1028837646236, 3522.7181825453904, 3526.612072672004, 6778.491613129035, 6782.660866956632, 6784.7964561063245, 6786.049953006583, 6790.1851777786, 6665.966670166618, 6667.433268172163, 6669.032990216391, 6675.79972600813, 6677.1319728435965, 6555.836104097436, 6740.561863478858, 6760.763373281911, 6768.898466523006, 6769.1538557679305, 6271.498280137487, 6470.805875823733, 6507.349265073455, 6521.673916304071, 6526.771562995273, 6484.773032943825, 6495.0, 6506.3493650634555, 6515.250746164063, 6529.0, 6840.863182736417, 6854.143232095988, 6854.897176542256, 6856.108705868404, 6858.931410685829, 4366.0, 4478.462584489752, 4482.081173359388, 4483.641308695232, 4489.483709373333, 6575.309592492719, 6576.473882089517, 6582.736690532325, 6601.735930562723, 6662.700178491883, 6362.300146983921, 6377.936220637735, 6392.360763923571, 6392.488600912009, 6393.680315984275, 6216.098665693539, 6321.652309122858, 6340.1123842661145, 6360.681965901779, 6412.743490260524, 6292.685365731603, 6298.212723409574, 6302.527310451826, 6302.590331628429, 6306.400891915261, 6446.066180146031, 6453.9354606453335, 6455.354464553507, 6456.354364563506, 6456.677166141768, 6055.757769689163, 6239.75040998355, 6306.4639505642535, 6306.747730090929, 6315.242170939517], "unit": "score", "name": "prototype.html", "value": 4769.162193915721}, {"lowerIsBetter": false, "replicates": [595.8540157661373, 707.9469039822011, 709.0852799888145, 729.9890501642473, 732.8680837449264, 12574.874251257485, 12881.098323117361, 12890.419931103099, 12894.677633059166, 12911.612651620455, 13610.183388996642, 13857.445702171926, 13920.930395348008, 13927.37326820293, 13962.511312104078, 639.3159319528107, 651.8859199640044, 799.4803377804444, 804.0512195609178, 805.2591615713558, 767.6814122139306, 774.3069952392606, 780.0210735526935, 782.4992005116729, 783.4006984656742, 829.9087100418949, 830.5847076461769, 832.5504227717025, 832.5629044751494, 847.6694089305176, 656.4649810404505, 796.5141263829059, 823.7816978500703, 830.2776584371605, 831.9126491718404, 613.3437222172278, 617.1945610977672, 617.2407938235995, 617.6757202468694, 619.0466681310776, 12475.875241247653, 12513.562025329069, 12516.186447880858, 12547.74904501914, 12568.371581420892, 11519.48162332697, 12170.75658486834, 12358.25850448967, 12469.127161098726, 12705.682357941034, 9702.466364349957, 9779.0, 9963.352382095212, 10039.89960100397, 10081.647142350055, 3524.6299138590334, 3530.2409981853766, 3549.6627820357025, 3554.253606742587, 3556.199855032623, 46658.30012549814, 46925.76537117293, 46950.76524617389, 47692.284615730794, 47710.28434573449, 9601.0, 9738.561764720605, 9768.120869121813, 10026.147777438999, 10060.899391006142, 16308.26612802403, 16485.58786030335, 16494.917525412297, 16538.917305413397, 16614.00315981045, 7460.179380268166, 7547.811304717426, 7581.166071732105, 7591.810204744926, 7706.922930770733, 4006.8397264109108, 4054.006768341775, 4079.347304431277, 4187.91624167515, 4286.099919016979, 2921.5033444314518, 2955.0100716259863, 2958.65975412826, 2960.378320552708, 3058.0520038788045, 552.033940603943, 565.2087078090624, 572.9971350143222, 573.435166361134, 583.116578383749, 514.5394871589981, 542.289600623177, 559.6222549778882, 578.3262499188482, 582.2169182449599, 7130.909235732203, 7395.519291246052, 7497.2877576630135, 7511.32398084175, 7606.163322034572, 496.19616221721043, 532.478171392038, 579.9797007104731, 580.3355158343672, 590.6367583935848, 3380.2732412531423, 3492.6158122606494, 3540.7167426606325, 3606.6573675500786, 3669.541307336583, 56315.0, 57308.0, 57590.13614795781, 57709.42290577041, 58068.0, 50372.748136259084, 50780.746096269286, 51169.23246151311, 51356.22965655518, 51748.74125629423, 45398.77300613476, 45448.54551454509, 45868.99999999933, 46086.539134608895, 46403.0, 7201.855962880818, 7287.489875708649, 7832.451728378959, 7854.567998760123, 7957.204279571996, 32523.512147317335, 32911.67088329086, 33443.1639209012, 33491.66508334885, 36579.085522862144, 43228.56771432245, 43512.78243608762, 43979.78010109929, 44086.0, 44088.33867491926, 9517.52412379392, 9535.284853636143, 9711.951440242754, 9899.851502227328, 10105.696829095139, 11252.943735281271, 11384.601538946097, 11411.201215914807, 11433.912918093964, 11548.191626586058, 10298.691039268833, 10458.738531536468, 10631.820476802392, 10697.197710171613, 10789.676309710721, 9590.904090959, 10498.212634052325, 10639.734006649896, 10783.460826958777, 11021.779564408507, 10198.898011019795, 10384.221183411124, 10556.208284378548, 10624.0, 10688.144948404264, 8531.573421329032, 8553.315734741082, 8777.341699372444, 8781.429207101519, 8846.0711625281, 7751.92248077512, 7895.368370530229, 7992.240737129963, 8216.404886561955, 8809.955950220208], "unit": "score", "name": "yui.html", "value": 5939.672959533798}], "name": "dromaeo_css", "value": 6623.682491224864}, {"lowerIsBetter": true, "subtests": [{"lowerIsBetter": true, "replicates": [111.0, 111.0, 106.0, 111.0, 111.0, 111.0, 101.0, 110.0, 110.0, 109.0], "unit": "score", "name": "ai-astar", "value": 109.1}, {"lowerIsBetter": true, "replicates": [154.0, 126.0, 154.0, 166.0, 126.0, 150.0, 161.0, 130.0, 173.0, 124.0], "unit": "score", "name": "audio-beat-detection", "value": 146.4}, {"lowerIsBetter": true, "replicates": [164.0, 164.0, 165.0, 163.0, 164.0, 163.0, 163.0, 166.0, 164.0, 165.0], "unit": "score", "name": "audio-dft", "value": 164.1}, {"lowerIsBetter": true, "replicates": [74.0, 73.0, 94.0, 96.0, 73.0, 74.0, 74.0, 133.0, 117.0, 73.0], "unit": "score", "name": "audio-fft", "value": 88.1}, {"lowerIsBetter": true, "replicates": [95.0, 97.0, 138.0, 96.0, 96.0, 98.0, 148.0, 96.0, 96.0, 143.0], "unit": "score", "name": "audio-oscillator", "value": 110.3}, {"lowerIsBetter": true, "replicates": [119.0, 114.0, 115.0, 115.0, 115.0, 115.0, 115.0, 114.0, 115.0, 115.0], "unit": "score", "name": "imaging-gaussian-blur", "value": 115.2}, {"lowerIsBetter": true, "replicates": [146.0, 145.0, 145.0, 145.0, 146.0, 145.0, 145.0, 146.0, 145.0, 145.0], "unit": "score", "name": "imaging-darkroom", "value": 145.3}, {"lowerIsBetter": true, "replicates": [95.0, 96.0, 96.0, 95.0, 96.0, 96.0, 96.0, 97.0, 97.0, 97.0], "unit": "score", "name": "imaging-desaturate", "value": 96.1}, {"lowerIsBetter": true, "replicates": [58.0, 59.0, 58.0, 57.0, 55.0, 58.0, 59.0, 68.0, 57.0, 53.0], "unit": "score", "name": "json-parse-financial", "value": 58.2}, {"lowerIsBetter": true, "replicates": [67.0, 67.0, 67.0, 67.0, 68.0, 67.0, 67.0, 67.0, 68.0, 68.0], "unit": "score", "name": "json-stringify-tinderbox", "value": 67.3}, {"lowerIsBetter": true, "replicates": [85.0, 82.0, 84.0, 85.0, 85.0, 91.0, 85.0, 85.0, 84.0, 85.0], "unit": "score", "name": "stanford-crypto-aes", "value": 85.1}, {"lowerIsBetter": true, "replicates": [116.0, 125.0, 116.0, 122.0, 116.0, 115.0, 121.0, 116.0, 123.0, 134.0], "unit": "score", "name": "stanford-crypto-ccm", "value": 120.4}, {"lowerIsBetter": true, "replicates": [153.0, 142.0, 164.0, 140.0, 149.0, 144.0, 157.0, 153.0, 151.0, 153.0], "unit": "score", "name": "stanford-crypto-pbkdf2", "value": 150.6}, {"lowerIsBetter": true, "replicates": [71.0, 68.0, 72.0, 68.0, 68.0, 67.0, 68.0, 69.0, 69.0, 67.0], "unit": "score", "name": "stanford-crypto-sha256-iterative", "value": 68.7}], "name": "kraken", "value": 1524.8999999999999}]} 05:26:51 INFO - TinderboxPrint: TalosResult: {"graphserver": {"kraken": {"url": "http://graphs.mozilla.org/graph.html#tests=[[232,64,35]]", "result": "1524.90"}, "dromaeo_css": {"url": "http://graphs.mozilla.org/graph.html#tests=[[72,64,35]]", "result": "6623.68"}}} 05:26:51 INFO - Return code: 0 05:26:52 INFO - Validating PERFHERDER_DATA against /builds/slave/test-pgo/build/tests/talos/treeherder-schemas/performance-artifact.json 05:26:52 INFO - # TBPL SUCCESS # 05:26:52 INFO - Running post-action listener: _resource_record_post_action 05:26:52 INFO - Running post-run listener: _resource_record_post_run 05:26:53 INFO - Total resource usage - Wall time: 1191s; CPU: 13.0%; Read bytes: 0; Write bytes: 550256640; Read time: 0; Write time: 684308 05:26:53 INFO - install - Wall time: 17s; CPU: 15.0%; Read bytes: 0; Write bytes: 257216512; Read time: 0; Write time: 394108 05:26:53 INFO - run-tests - Wall time: 1176s; CPU: 13.0%; Read bytes: 0; Write bytes: 292442112; Read time: 0; Write time: 290200 05:26:53 INFO - Running post-run listener: _upload_blobber_files 05:26:53 INFO - Blob upload gear active. 05:26:53 INFO - Preparing to upload files from /builds/slave/test-pgo/build/blobber_upload_dir. 05:26:53 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:26:53 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:26:53 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:26:53 INFO - (blobuploader) - INFO - Open directory for files ... 05:26:53 INFO - (blobuploader) - INFO - Uploading /builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs_errorsummary.log ... 05:26:53 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 05:26:53 INFO - (blobuploader) - INFO - Uploading, attempt #1. 05:26:54 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_errorsummary.log: uploaded 05:26:54 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 05:26:54 INFO - (blobuploader) - INFO - Done attempting. 05:26:54 INFO - (blobuploader) - INFO - Uploading /builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs_raw.log ... 05:26:54 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 05:26:54 INFO - (blobuploader) - INFO - Uploading, attempt #1. 05:26:55 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_raw.log: uploaded 05:26:55 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 05:26:55 INFO - (blobuploader) - INFO - Done attempting. 05:26:55 INFO - (blobuploader) - INFO - Iteration through files over. 05:26:55 INFO - Return code: 0 05:26:55 INFO - rmtree: /builds/slave/test-pgo/build/uploaded_files.json 05:26:55 INFO - retry: Calling remove with args: ('/builds/slave/test-pgo/build/uploaded_files.json',), kwargs: {}, attempt #1 05:26:55 INFO - Setting buildbot property blobber_files to {"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/7c45e0f09d62c63ba1db2c607d4f87a87a5a95690a4f3bc9bc8826241254ca84cea0fcd807451325950271daad8aa4b4924faee570439c88d2f3b6296c24f63f", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/1d1057f58d186c38c3f480aeadcf546330f929c9b4aaf2af582ab9a132cd92c1e4807baeaf1f35779457f55ade842249bcd5db60d880c587c8326e6714847b9a"} 05:26:55 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test-pgo/properties/blobber_files 05:26:55 INFO - Writing to file /builds/slave/test-pgo/properties/blobber_files 05:26:55 INFO - Contents: 05:26:55 INFO - blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/7c45e0f09d62c63ba1db2c607d4f87a87a5a95690a4f3bc9bc8826241254ca84cea0fcd807451325950271daad8aa4b4924faee570439c88d2f3b6296c24f63f", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/1d1057f58d186c38c3f480aeadcf546330f929c9b4aaf2af582ab9a132cd92c1e4807baeaf1f35779457f55ade842249bcd5db60d880c587c8326e6714847b9a"} 05:26:55 INFO - Running post-run listener: copy_logs_to_upload_dir 05:26:55 INFO - Copying logs to upload dir... 05:26:55 INFO - mkdir: /builds/slave/test-pgo/build/upload/logs 05:26:55 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1228.934191 ========= master_lag: 0.01 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 28 secs) (at 2016-02-15 05:26:54.646730) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-02-15 05:26:54.650864) ========= 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=b5f16d05e5ea93ddf675e67e000001bf-1455541515.16601-1802459910 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/7c45e0f09d62c63ba1db2c607d4f87a87a5a95690a4f3bc9bc8826241254ca84cea0fcd807451325950271daad8aa4b4924faee570439c88d2f3b6296c24f63f", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/1d1057f58d186c38c3f480aeadcf546330f929c9b4aaf2af582ab9a132cd92c1e4807baeaf1f35779457f55ade842249bcd5db60d880c587c8326e6714847b9a"} build_url:https://queue.taskcluster.net/v1/task/Xgllv7XYTiun4XdBZpV-RA/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.011312 build_url: 'https://queue.taskcluster.net/v1/task/Xgllv7XYTiun4XdBZpV-RA/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2' blobber_files: '{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/7c45e0f09d62c63ba1db2c607d4f87a87a5a95690a4f3bc9bc8826241254ca84cea0fcd807451325950271daad8aa4b4924faee570439c88d2f3b6296c24f63f", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/1d1057f58d186c38c3f480aeadcf546330f929c9b4aaf2af582ab9a132cd92c1e4807baeaf1f35779457f55ade842249bcd5db60d880c587c8326e6714847b9a"}' ========= master_lag: 0.01 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-02-15 05:26:54.676304) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-02-15 05:26:54.676658) ========= 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=b5f16d05e5ea93ddf675e67e000001bf-1455541515.16601-1802459910 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004496 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-02-15 05:26:54.762660) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-02-15 05:26:54.763038) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-02-15 05:26:54.763362) ========= ========= Total master_lag: 0.30 =========