builder: fx-team_ubuntu64_hw_test-dromaeojs-pgo slave: talos-linux64-ix-062 starttime: 1456774708.61 results: success (0) buildid: 20160229083150 builduid: 7c88152fade649b0b7a942440a089843 revision: 6af962bff65de440a88387256ce311c5e5e2e440 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-02-29 11:38:28.610750) ========= master: http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-02-29 11:38:28.611821) ========= ========= Started set props: basedir (results: 0, elapsed: 0 secs) (at 2016-02-29 11:38:28.612523) ========= 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=a4ce256d2ec601f24a60a71e000001bc-1456774677.566774-1852363187 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False /builds/slave/test-pgo program finished with exit code 0 elapsedTime=0.005695 basedir: '/builds/slave/test-pgo' ========= master_lag: 0.02 ========= ========= Finished set props: basedir (results: 0, elapsed: 0 secs) (at 2016-02-29 11:38:28.637987) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-02-29 11:38:28.638666) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-02-29 11:38:28.667113) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-02-29 11:38:28.667796) ========= 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=a4ce256d2ec601f24a60a71e000001bc-1456774677.566774-1852363187 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.014803 ========= master_lag: 0.04 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-02-29 11:38:28.719431) ========= ========= Started set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2016-02-29 11:38:28.720111) ========= script_repo_url: https://hg.mozilla.org/build/mozharness ========= Finished set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2016-02-29 11:38:28.720797) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-02-29 11:38:28.721107) ========= 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=a4ce256d2ec601f24a60a71e000001bc-1456774677.566774-1852363187 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2016-02-29 11:38:28-- 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% 157M=0s 2016-02-29 11:38:29 (157 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.155973 ========= master_lag: 0.13 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-02-29 11:38:29.007936) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-02-29 11:38:29.008289) ========= 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=a4ce256d2ec601f24a60a71e000001bc-1456774677.566774-1852363187 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.077833 ========= master_lag: 0.01 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-02-29 11:38:29.099736) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-02-29 11:38:29.100538) ========= bash -c 'python archiver_client.py mozharness --repo integration/fx-team --rev 6af962bff65de440a88387256ce311c5e5e2e440 --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 6af962bff65de440a88387256ce311c5e5e2e440 --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=a4ce256d2ec601f24a60a71e000001bc-1456774677.566774-1852363187 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2016-02-29 11:38:29,297 truncating revision to first 12 chars 2016-02-29 11:38:29,297 Setting DEBUG logging. 2016-02-29 11:38:29,297 attempt 1/10 2016-02-29 11:38:29,297 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/integration/fx-team/6af962bff65d?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-02-29 11:38:29,665 unpacking tar archive at: fx-team-6af962bff65d/testing/mozharness/ program finished with exit code 0 elapsedTime=0.674050 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-02-29 11:38:29.789325) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-02-29 11:38:29.789809) ========= echo 6af962bff65de440a88387256ce311c5e5e2e440 in dir /builds/slave/test-pgo/. (timeout 1200 secs) watching logfiles {} argv: ['echo', u'6af962bff65de440a88387256ce311c5e5e2e440'] 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=a4ce256d2ec601f24a60a71e000001bc-1456774677.566774-1852363187 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 6af962bff65de440a88387256ce311c5e5e2e440 program finished with exit code 0 elapsedTime=0.004657 script_repo_revision: '6af962bff65de440a88387256ce311c5e5e2e440' ========= master_lag: 0.05 ========= ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-02-29 11:38:29.844427) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-02-29 11:38:29.845066) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-02-29 11:38:29.856526) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 31 secs) (at 2016-02-29 11:38:29.857224) ========= /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=a4ce256d2ec601f24a60a71e000001bc-1456774677.566774-1852363187 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 11:38:30 INFO - MultiFileLogger online at 20160229 11:38:30 in /builds/slave/test-pgo 11:38:30 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 11:38:30 INFO - Dumping config to /builds/slave/test-pgo/logs/localconfig.json. 11:38:30 INFO - {'append_to_log': False, 11:38:30 INFO - 'base_work_dir': '/builds/slave/test-pgo', 11:38:30 INFO - 'blob_upload_branch': 'Fx-Team', 11:38:30 INFO - 'blob_uploader_auth_file': '/builds/slave/test-pgo/oauth.txt', 11:38:30 INFO - 'branch': 'Fx-Team', 11:38:30 INFO - 'buildbot_json_path': 'buildprops.json', 11:38:30 INFO - 'config_files': ('talos/linux_config.py',), 11:38:30 INFO - 'default_actions': ('clobber', 11:38:30 INFO - 'read-buildbot-config', 11:38:30 INFO - 'download-and-extract', 11:38:30 INFO - 'populate-webroot', 11:38:30 INFO - 'create-virtualenv', 11:38:30 INFO - 'install', 11:38:30 INFO - 'run-tests'), 11:38:30 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 11:38:30 INFO - 'download_minidump_stackwalk': True, 11:38:30 INFO - 'download_symbols': 'ondemand', 11:38:30 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 11:38:30 INFO - 'tooltool.py': '/tools/tooltool.py', 11:38:30 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 11:38:30 INFO - '/tools/misc-python/virtualenv.py')}, 11:38:30 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 11:38:30 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 11:38:30 INFO - 'installer_path': 'installer.exe', 11:38:30 INFO - 'log_level': 'info', 11:38:30 INFO - 'log_name': 'talos', 11:38:30 INFO - 'log_to_console': True, 11:38:30 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 11:38:30 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 11:38:30 INFO - 'opt_config_files': (), 11:38:30 INFO - 'pip_index': False, 11:38:30 INFO - 'sps_profile': False, 11:38:30 INFO - 'sps_profile_interval': 0, 11:38:30 INFO - 'suite': 'dromaeojs', 11:38:30 INFO - 'system_bits': '32', 11:38:30 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 11:38:30 INFO - 'title': 'talos-linux64-ix-062', 11:38:30 INFO - 'tooltool_cache': '/builds/tooltool_cache', 11:38:30 INFO - 'use_talos_json': True, 11:38:30 INFO - 'virtualenv_path': '/builds/slave/test-pgo/build/venv', 11:38:30 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 11:38:30 INFO - 'work_dir': 'build'} 11:38:30 INFO - ##### 11:38:30 INFO - ##### Running clobber step. 11:38:30 INFO - ##### 11:38:30 INFO - Running pre-action listener: _resource_record_pre_action 11:38:30 INFO - Running main action method: clobber 11:38:30 INFO - rmtree: /builds/slave/test-pgo/build 11:38:30 INFO - retry: Calling rmtree with args: ('/builds/slave/test-pgo/build',), kwargs: {}, attempt #1 11:38:34 INFO - Running post-action listener: _resource_record_post_action 11:38:34 INFO - ##### 11:38:34 INFO - ##### Running read-buildbot-config step. 11:38:34 INFO - ##### 11:38:34 INFO - Running pre-action listener: _resource_record_pre_action 11:38:34 INFO - Running main action method: read_buildbot_config 11:38:34 INFO - Using buildbot properties: 11:38:34 INFO - { 11:38:34 INFO - "project": "", 11:38:34 INFO - "product": "firefox", 11:38:34 INFO - "script_repo_revision": "production", 11:38:34 INFO - "builddir": "fx-team_ubuntu64_hw_test-dromaeojs", 11:38:34 INFO - "repository": "", 11:38:34 INFO - "buildername": "Ubuntu HW 12.04 x64 fx-team pgo talos dromaeojs", 11:38:34 INFO - "buildid": "20160229083150", 11:38:34 INFO - "pgo_build": "True", 11:38:34 INFO - "basedir": "/builds/slave/test-pgo", 11:38:34 INFO - "buildnumber": 963, 11:38:34 INFO - "slavename": "talos-linux64-ix-062", 11:38:34 INFO - "master": "http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/", 11:38:34 INFO - "platform": "ubuntu64_hw", 11:38:34 INFO - "scheduler": "tests-fx-team-linux64-pgo-talos", 11:38:34 INFO - "branch": "fx-team", 11:38:34 INFO - "repo_path": "integration/fx-team", 11:38:34 INFO - "revision": "6af962bff65de440a88387256ce311c5e5e2e440", 11:38:34 INFO - "stage_platform": "linux64-pgo", 11:38:34 INFO - "builduid": "7c88152fade649b0b7a942440a089843", 11:38:34 INFO - "slavebuilddir": "test" 11:38:34 INFO - } 11:38:34 INFO - Found installer url https://queue.taskcluster.net/v1/task/JVZ9Gd0AQk6ucaWKcJEwOA/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2. 11:38:34 INFO - Running post-action listener: _resource_record_post_action 11:38:34 INFO - ##### 11:38:34 INFO - ##### Running download-and-extract step. 11:38:34 INFO - ##### 11:38:34 INFO - Running pre-action listener: _resource_record_pre_action 11:38:34 INFO - Running main action method: download_and_extract 11:38:34 INFO - mkdir: /builds/slave/test-pgo/build/tests 11:38: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')]} 11:38:34 INFO - https://queue.taskcluster.net/v1/task/JVZ9Gd0AQk6ucaWKcJEwOA/artifacts/public/build/test_packages.json matches https://queue.taskcluster.net 11:38:34 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/JVZ9Gd0AQk6ucaWKcJEwOA/artifacts/public/build/test_packages.json 11:38:34 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/JVZ9Gd0AQk6ucaWKcJEwOA/artifacts/public/build/test_packages.json 11:38:34 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/JVZ9Gd0AQk6ucaWKcJEwOA/artifacts/public/build/test_packages.json to /builds/slave/test-pgo/build/test_packages.json 11:38:34 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/JVZ9Gd0AQk6ucaWKcJEwOA/artifacts/public/build/test_packages.json', 'file_name': '/builds/slave/test-pgo/build/test_packages.json'}, attempt #1 11:38:35 INFO - Downloaded 1448 bytes. 11:38:35 INFO - Reading from file /builds/slave/test-pgo/build/test_packages.json 11:38:35 INFO - Using the following test package requirements: 11:38:35 INFO - {u'common': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip'], 11:38:35 INFO - u'cppunittest': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 11:38:35 INFO - u'firefox-47.0a1.en-US.linux-x86_64.cppunittest.tests.zip'], 11:38:35 INFO - u'gtest': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 11:38:35 INFO - u'firefox-47.0a1.en-US.linux-x86_64.gtest.tests.zip'], 11:38:35 INFO - u'jittest': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 11:38:35 INFO - u'jsshell-linux-x86_64.zip'], 11:38:35 INFO - u'mochitest': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 11:38:35 INFO - u'firefox-47.0a1.en-US.linux-x86_64.mochitest.tests.zip'], 11:38:35 INFO - u'mozbase': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip'], 11:38:35 INFO - u'reftest': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 11:38:35 INFO - u'firefox-47.0a1.en-US.linux-x86_64.reftest.tests.zip'], 11:38:35 INFO - u'talos': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 11:38:35 INFO - u'firefox-47.0a1.en-US.linux-x86_64.talos.tests.zip'], 11:38:35 INFO - u'web-platform': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 11:38:35 INFO - u'firefox-47.0a1.en-US.linux-x86_64.web-platform.tests.zip'], 11:38:35 INFO - u'webapprt': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip'], 11:38:35 INFO - u'xpcshell': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 11:38:35 INFO - u'firefox-47.0a1.en-US.linux-x86_64.xpcshell.tests.zip']} 11:38:35 INFO - Downloading packages: [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 11:38:35 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://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')]} 11:38:35 INFO - https://queue.taskcluster.net/v1/task/JVZ9Gd0AQk6ucaWKcJEwOA/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 11:38:35 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/JVZ9Gd0AQk6ucaWKcJEwOA/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip 11:38:35 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/JVZ9Gd0AQk6ucaWKcJEwOA/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip 11:38:35 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/JVZ9Gd0AQk6ucaWKcJEwOA/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 11:38:35 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/JVZ9Gd0AQk6ucaWKcJEwOA/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 11:38:36 INFO - Downloaded 23372555 bytes. 11:38:36 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test-pgo/build/tests'] 11:38:36 INFO - Copy/paste: unzip -q -o /builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test-pgo/build/tests 11:38:37 INFO - Return code: 0 11:38:37 INFO - Downloading packages: [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', u'firefox-47.0a1.en-US.linux-x86_64.talos.tests.zip'] for test suite category: talos 11:38:37 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:38:37 INFO - https://queue.taskcluster.net/v1/task/JVZ9Gd0AQk6ucaWKcJEwOA/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 11:38:37 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/JVZ9Gd0AQk6ucaWKcJEwOA/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip 11:38:37 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/JVZ9Gd0AQk6ucaWKcJEwOA/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip 11:38:37 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/JVZ9Gd0AQk6ucaWKcJEwOA/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 11:38:37 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/JVZ9Gd0AQk6ucaWKcJEwOA/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 11:38:38 INFO - Downloaded 23372555 bytes. 11:38:38 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'] 11:38:38 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 11:38:40 INFO - Return code: 0 11:38:40 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:38:40 INFO - https://queue.taskcluster.net/v1/task/JVZ9Gd0AQk6ucaWKcJEwOA/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.talos.tests.zip matches https://queue.taskcluster.net 11:38:40 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/JVZ9Gd0AQk6ucaWKcJEwOA/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.talos.tests.zip 11:38:40 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/JVZ9Gd0AQk6ucaWKcJEwOA/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.talos.tests.zip 11:38:40 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/JVZ9Gd0AQk6ucaWKcJEwOA/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 11:38:40 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/JVZ9Gd0AQk6ucaWKcJEwOA/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 11:38:41 INFO - Downloaded 10713410 bytes. 11:38:41 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'] 11:38:41 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 11:38:41 INFO - Return code: 0 11:38: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')]} 11:38:41 INFO - https://queue.taskcluster.net/v1/task/JVZ9Gd0AQk6ucaWKcJEwOA/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2 matches https://queue.taskcluster.net 11:38:41 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/JVZ9Gd0AQk6ucaWKcJEwOA/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2 11:38:41 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/JVZ9Gd0AQk6ucaWKcJEwOA/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2 11:38:41 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/JVZ9Gd0AQk6ucaWKcJEwOA/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 11:38:41 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/JVZ9Gd0AQk6ucaWKcJEwOA/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 11:38:42 INFO - Downloaded 56588995 bytes. 11:38:42 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/JVZ9Gd0AQk6ucaWKcJEwOA/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2 11:38:42 INFO - mkdir: /builds/slave/test-pgo/properties 11:38:42 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test-pgo/properties/build_url 11:38:42 INFO - Writing to file /builds/slave/test-pgo/properties/build_url 11:38:42 INFO - Contents: 11:38:42 INFO - build_url:https://queue.taskcluster.net/v1/task/JVZ9Gd0AQk6ucaWKcJEwOA/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2 11:38:43 INFO - Running post-action listener: _resource_record_post_action 11:38:43 INFO - Running post-action listener: set_extra_try_arguments 11:38:43 INFO - ##### 11:38:43 INFO - ##### Running populate-webroot step. 11:38:43 INFO - ##### 11:38:43 INFO - Running pre-action listener: _resource_record_pre_action 11:38:43 INFO - Running main action method: populate_webroot 11:38:43 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 11:38:43 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 11:38:43 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 11:38:43 INFO - '--tppagecycles', 11:38:43 INFO - '7'], 11:38:43 INFO - 'tests': ['tsvgm']}}, 11:38:43 INFO - 'suites': {'chromez': {'tests': ['tresize', 'tcanvasmark']}, 11:38:43 INFO - 'chromez-e10s': {'talos_options': ['--e10s'], 11:38:43 INFO - 'tests': ['tresize', 'tcanvasmark']}, 11:38:43 INFO - 'dromaeojs': {'tests': ['dromaeo_css', 'kraken']}, 11:38:43 INFO - 'dromaeojs-e10s': {'talos_options': ['--e10s'], 11:38:43 INFO - 'tests': ['dromaeo_css', 'kraken']}, 11:38:43 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 11:38:43 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 11:38:43 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 11:38:43 INFO - 'talos_options': ['--e10s'], 11:38:43 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 11:38:43 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 11:38:43 INFO - 'tests': ['damp', 'tps']}, 11:38:43 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 11:38:43 INFO - 'talos_options': ['--e10s'], 11:38:43 INFO - 'tests': ['damp', 'tps']}, 11:38:43 INFO - 'g3': {'tests': ['dromaeo_dom']}, 11:38:43 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 11:38:43 INFO - 'other': {'tests': ['a11yr', 11:38:43 INFO - 'ts_paint', 11:38:43 INFO - 'tpaint', 11:38:43 INFO - 'sessionrestore', 11:38:43 INFO - 'sessionrestore_no_auto_restore']}, 11:38:43 INFO - 'other-e10s': {'talos_options': ['--e10s'], 11:38:43 INFO - 'tests': ['a11yr', 11:38:43 INFO - 'ts_paint', 11:38:43 INFO - 'tpaint', 11:38:43 INFO - 'sessionrestore', 11:38:43 INFO - 'sessionrestore_no_auto_restore']}, 11:38:43 INFO - 'other-e10s_l64': {'talos_options': ['--e10s'], 11:38:43 INFO - 'tests': ['a11yr', 11:38:43 INFO - 'ts_paint', 11:38:43 INFO - 'tpaint', 11:38:43 INFO - 'sessionrestore', 11:38:43 INFO - 'sessionrestore_no_auto_restore']}, 11:38:43 INFO - 'other-e10s_nol64': {'talos_options': ['--e10s'], 11:38:43 INFO - 'tests': ['a11yr', 11:38:43 INFO - 'ts_paint', 11:38:43 INFO - 'tpaint', 11:38:43 INFO - 'sessionrestore', 11:38:43 INFO - 'sessionrestore_no_auto_restore']}, 11:38:43 INFO - 'other_l64': {'tests': ['a11yr', 11:38:43 INFO - 'ts_paint', 11:38:43 INFO - 'tpaint', 11:38:43 INFO - 'sessionrestore', 11:38:43 INFO - 'sessionrestore_no_auto_restore']}, 11:38:43 INFO - 'other_nol64': {'tests': ['a11yr', 11:38:43 INFO - 'ts_paint', 11:38:43 INFO - 'tpaint', 11:38:43 INFO - 'sessionrestore', 11:38:43 INFO - 'sessionrestore_no_auto_restore']}, 11:38:43 INFO - 'svgr': {'tests': ['tsvgx', 11:38:43 INFO - 'tsvgr_opacity', 11:38:43 INFO - 'tart', 11:38:43 INFO - 'tscrollx', 11:38:43 INFO - 'cart']}, 11:38:43 INFO - 'svgr-e10s': {'talos_options': ['--e10s'], 11:38:43 INFO - 'tests': ['tsvgx', 11:38:43 INFO - 'tsvgr_opacity', 11:38:43 INFO - 'tart', 11:38:43 INFO - 'tscrollx', 11:38:43 INFO - 'cart']}, 11:38:43 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 11:38:43 INFO - 'tests': ['tp5o']}, 11:38:43 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 11:38:43 INFO - 'talos_options': ['--e10s'], 11:38:43 INFO - 'tests': ['tp5o']}, 11:38:43 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 11:38:43 INFO - 'talos_options': ['--xperf_path', 11:38:43 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 11:38:43 INFO - 'tests': ['tp5n']}, 11:38:43 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 11:38:43 INFO - 'talos_options': ['--e10s', 11:38:43 INFO - '--xperf_path', 11:38:43 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 11:38:43 INFO - 'tests': ['tp5n']}}, 11:38:43 INFO - 'talos.zip': {'path': '', 11:38:43 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 11:38:43 INFO - Running post-action listener: _resource_record_post_action 11:38:43 INFO - ##### 11:38:43 INFO - ##### Running create-virtualenv step. 11:38:43 INFO - ##### 11:38:43 INFO - Running pre-action listener: _resource_record_pre_action 11:38:43 INFO - Running main action method: create_virtualenv 11:38:43 INFO - Creating virtualenv /builds/slave/test-pgo/build/venv 11:38:43 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 11:38:43 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test-pgo/build/venv 11:38:43 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 11:38:43 INFO - Using real prefix '/usr' 11:38:43 INFO - New python executable in /builds/slave/test-pgo/build/venv/bin/python 11:38:44 INFO - Installing distribute.............................................................................................................................................................................................done. 11:38:46 INFO - Installing pip.................done. 11:38:46 INFO - Return code: 0 11:38:46 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test-pgo/build/venv 11:38:46 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:38:46 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 11:38:46 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:38:46 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:38:46 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 11:38:46 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:38:46 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 0x7f2131d71f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x285a8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2927670>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x29b68c0>, '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 0x29b77c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x29b7c50>, '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': 'a4ce256d2ec601f24a60a71e000001bc-1456774677.566774-1852363187', '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 11:38:46 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 11:38:46 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 11:38:46 INFO - Using env: {'DISPLAY': ':0', 11:38:46 INFO - 'HOME': '/home/cltbld', 11:38:46 INFO - 'LANG': 'en_US.UTF-8', 11:38:46 INFO - 'LANGUAGE': 'en_US:en', 11:38:46 INFO - 'LOGNAME': 'cltbld', 11:38:46 INFO - 'MAIL': '/var/mail/cltbld', 11:38:46 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 11:38:46 INFO - 'MOZ_NO_REMOTE': '1', 11:38:46 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 11:38:46 INFO - 'NO_EM_RESTART': '1', 11:38:46 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 11:38:46 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 11:38:46 INFO - 'PWD': '/builds/slave/test-pgo', 11:38:46 INFO - 'SHELL': '/bin/bash', 11:38:46 INFO - 'SHLVL': '1', 11:38:46 INFO - 'TERM': 'linux', 11:38:46 INFO - 'TMOUT': '86400', 11:38:46 INFO - 'USER': 'cltbld', 11:38:46 INFO - 'XDG_SESSION_COOKIE': 'a4ce256d2ec601f24a60a71e000001bc-1456774677.566774-1852363187', 11:38:46 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 11:38:46 INFO - '_': '/tools/buildbot/bin/python'} 11:38:46 INFO - Ignoring indexes: https://pypi.python.org/simple/ 11:38:46 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 11:38:46 INFO - Cleaning up... 11:38:46 INFO - Return code: 0 11:38:46 INFO - Installing psutil>=0.7.1 into virtualenv /builds/slave/test-pgo/build/venv 11:38:46 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:38:46 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 11:38:46 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:38:46 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:38:46 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 11:38:46 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:38:46 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 0x7f2131d71f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x285a8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2927670>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x29b68c0>, '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 0x29b77c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x29b7c50>, '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': 'a4ce256d2ec601f24a60a71e000001bc-1456774677.566774-1852363187', '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 11:38:46 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 11:38:46 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 11:38:46 INFO - Using env: {'DISPLAY': ':0', 11:38:46 INFO - 'HOME': '/home/cltbld', 11:38:46 INFO - 'LANG': 'en_US.UTF-8', 11:38:46 INFO - 'LANGUAGE': 'en_US:en', 11:38:46 INFO - 'LOGNAME': 'cltbld', 11:38:46 INFO - 'MAIL': '/var/mail/cltbld', 11:38:46 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 11:38:46 INFO - 'MOZ_NO_REMOTE': '1', 11:38:46 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 11:38:46 INFO - 'NO_EM_RESTART': '1', 11:38:46 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 11:38:46 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 11:38:46 INFO - 'PWD': '/builds/slave/test-pgo', 11:38:46 INFO - 'SHELL': '/bin/bash', 11:38:46 INFO - 'SHLVL': '1', 11:38:46 INFO - 'TERM': 'linux', 11:38:46 INFO - 'TMOUT': '86400', 11:38:46 INFO - 'USER': 'cltbld', 11:38:46 INFO - 'XDG_SESSION_COOKIE': 'a4ce256d2ec601f24a60a71e000001bc-1456774677.566774-1852363187', 11:38:46 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 11:38:46 INFO - '_': '/tools/buildbot/bin/python'} 11:38:46 INFO - Ignoring indexes: https://pypi.python.org/simple/ 11:38:46 INFO - Downloading/unpacking psutil>=0.7.1 11:38: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 11:38: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 11:38: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 11:38: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 11:38: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 11:38: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 11:38:48 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/psutil/setup.py) egg_info for package psutil 11:38:48 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 11:38:48 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 11:38:48 INFO - Installing collected packages: psutil 11:38:48 INFO - Running setup.py install for psutil 11:38:48 INFO - building 'psutil._psutil_linux' extension 11:38:48 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 11:38:48 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 11:38:48 INFO - building 'psutil._psutil_posix' extension 11:38:48 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 11:38:49 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 11:38:49 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 11:38:49 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 11:38:49 INFO - Successfully installed psutil 11:38:49 INFO - Cleaning up... 11:38:49 INFO - Return code: 0 11:38:49 INFO - Installing mozsystemmonitor==0.0.0 into virtualenv /builds/slave/test-pgo/build/venv 11:38:49 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')]} 11:38:49 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 11:38:49 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:38:49 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')]} 11:38:49 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 11:38:49 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:38:49 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 0x7f2131d71f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x285a8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2927670>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x29b68c0>, '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 0x29b77c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x29b7c50>, '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': 'a4ce256d2ec601f24a60a71e000001bc-1456774677.566774-1852363187', '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 11:38:49 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 11:38:49 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 11:38:49 INFO - Using env: {'DISPLAY': ':0', 11:38:49 INFO - 'HOME': '/home/cltbld', 11:38:49 INFO - 'LANG': 'en_US.UTF-8', 11:38:49 INFO - 'LANGUAGE': 'en_US:en', 11:38:49 INFO - 'LOGNAME': 'cltbld', 11:38:49 INFO - 'MAIL': '/var/mail/cltbld', 11:38:49 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 11:38:49 INFO - 'MOZ_NO_REMOTE': '1', 11:38:49 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 11:38:49 INFO - 'NO_EM_RESTART': '1', 11:38:49 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 11:38:49 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 11:38:49 INFO - 'PWD': '/builds/slave/test-pgo', 11:38:49 INFO - 'SHELL': '/bin/bash', 11:38:49 INFO - 'SHLVL': '1', 11:38:49 INFO - 'TERM': 'linux', 11:38:49 INFO - 'TMOUT': '86400', 11:38:49 INFO - 'USER': 'cltbld', 11:38:49 INFO - 'XDG_SESSION_COOKIE': 'a4ce256d2ec601f24a60a71e000001bc-1456774677.566774-1852363187', 11:38:49 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 11:38:49 INFO - '_': '/tools/buildbot/bin/python'} 11:38:49 INFO - Ignoring indexes: https://pypi.python.org/simple/ 11:38:49 INFO - Downloading/unpacking mozsystemmonitor==0.0.0 11:38:49 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 11:38:49 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 11:38:49 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 11:38:49 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 11:38:49 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 11:38:49 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 11:38:51 INFO - Downloading mozsystemmonitor-0.0.tar.gz 11:38:51 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 11:38:51 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=0.7.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.0.0) 11:38:51 INFO - Installing collected packages: mozsystemmonitor 11:38:51 INFO - Running setup.py install for mozsystemmonitor 11:38:51 INFO - Successfully installed mozsystemmonitor 11:38:51 INFO - Cleaning up... 11:38:51 INFO - Return code: 0 11:38:51 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test-pgo/build/venv 11:38:51 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')]} 11:38:51 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 11:38:51 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:38:51 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')]} 11:38:51 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 11:38:51 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:38:51 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 0x7f2131d71f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x285a8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2927670>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x29b68c0>, '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 0x29b77c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x29b7c50>, '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': 'a4ce256d2ec601f24a60a71e000001bc-1456774677.566774-1852363187', '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 11:38:51 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 11:38:51 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 11:38:51 INFO - Using env: {'DISPLAY': ':0', 11:38:51 INFO - 'HOME': '/home/cltbld', 11:38:51 INFO - 'LANG': 'en_US.UTF-8', 11:38:51 INFO - 'LANGUAGE': 'en_US:en', 11:38:51 INFO - 'LOGNAME': 'cltbld', 11:38:51 INFO - 'MAIL': '/var/mail/cltbld', 11:38:51 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 11:38:51 INFO - 'MOZ_NO_REMOTE': '1', 11:38:51 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 11:38:51 INFO - 'NO_EM_RESTART': '1', 11:38:51 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 11:38:51 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 11:38:51 INFO - 'PWD': '/builds/slave/test-pgo', 11:38:51 INFO - 'SHELL': '/bin/bash', 11:38:51 INFO - 'SHLVL': '1', 11:38:51 INFO - 'TERM': 'linux', 11:38:51 INFO - 'TMOUT': '86400', 11:38:51 INFO - 'USER': 'cltbld', 11:38:51 INFO - 'XDG_SESSION_COOKIE': 'a4ce256d2ec601f24a60a71e000001bc-1456774677.566774-1852363187', 11:38:51 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 11:38:51 INFO - '_': '/tools/buildbot/bin/python'} 11:38:51 INFO - Ignoring indexes: https://pypi.python.org/simple/ 11:38:51 INFO - Downloading/unpacking blobuploader==1.2.4 11:38:51 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 11:38:51 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 11:38:51 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 11:38:51 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 11:38:51 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 11:38:51 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 11:38:53 INFO - Downloading blobuploader-1.2.4.tar.gz 11:38:53 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 11:38:53 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 11:38:53 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 11:38:53 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 11:38:53 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 11:38:53 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 11:38:53 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 11:38:53 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 11:38:53 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/requests/setup.py) egg_info for package requests 11:38:53 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 11:38:53 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 11:38:53 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 11:38:53 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 11:38:53 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 11:38:53 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 11:38:53 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 11:38:54 INFO - Downloading docopt-0.6.1.tar.gz 11:38:54 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/docopt/setup.py) egg_info for package docopt 11:38:54 INFO - Installing collected packages: blobuploader, requests, docopt 11:38:54 INFO - Running setup.py install for blobuploader 11:38:54 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 11:38:54 INFO - changing mode of /builds/slave/test-pgo/build/venv/bin/blobberc.py to 775 11:38:54 INFO - Running setup.py install for requests 11:38:54 INFO - Running setup.py install for docopt 11:38:54 INFO - Successfully installed blobuploader requests docopt 11:38:54 INFO - Cleaning up... 11:38:54 INFO - Return code: 0 11:38:54 INFO - Installing None into virtualenv /builds/slave/test-pgo/build/venv 11:38: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')]} 11:38:54 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 11:38:54 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:38: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')]} 11:38:54 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 11:38:54 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:38:54 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 0x7f2131d71f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x285a8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2927670>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x29b68c0>, '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 0x29b77c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x29b7c50>, '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': 'a4ce256d2ec601f24a60a71e000001bc-1456774677.566774-1852363187', '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 11:38:54 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 11:38:54 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 11:38:54 INFO - Using env: {'DISPLAY': ':0', 11:38:54 INFO - 'HOME': '/home/cltbld', 11:38:54 INFO - 'LANG': 'en_US.UTF-8', 11:38:54 INFO - 'LANGUAGE': 'en_US:en', 11:38:54 INFO - 'LOGNAME': 'cltbld', 11:38:54 INFO - 'MAIL': '/var/mail/cltbld', 11:38:54 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 11:38:54 INFO - 'MOZ_NO_REMOTE': '1', 11:38:54 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 11:38:54 INFO - 'NO_EM_RESTART': '1', 11:38:54 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 11:38:54 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 11:38:54 INFO - 'PWD': '/builds/slave/test-pgo', 11:38:54 INFO - 'SHELL': '/bin/bash', 11:38:54 INFO - 'SHLVL': '1', 11:38:54 INFO - 'TERM': 'linux', 11:38:54 INFO - 'TMOUT': '86400', 11:38:54 INFO - 'USER': 'cltbld', 11:38:54 INFO - 'XDG_SESSION_COOKIE': 'a4ce256d2ec601f24a60a71e000001bc-1456774677.566774-1852363187', 11:38:54 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 11:38:54 INFO - '_': '/tools/buildbot/bin/python'} 11:38:55 INFO - Ignoring indexes: https://pypi.python.org/simple/ 11:38:55 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/manifestparser 11:38:55 INFO - Running setup.py (path:/tmp/pip-t0Mffl-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/manifestparser 11:38:55 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozcrash 11:38:55 INFO - Running setup.py (path:/tmp/pip-qOdY5E-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozcrash 11:38:55 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdebug 11:38:55 INFO - Running setup.py (path:/tmp/pip-lyxYeo-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdebug 11:38:55 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdevice 11:38:55 INFO - Running setup.py (path:/tmp/pip-57N72P-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdevice 11:38:55 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozfile 11:38:55 INFO - Running setup.py (path:/tmp/pip-nxsAfI-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozfile 11:38:55 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozhttpd 11:38:55 INFO - Running setup.py (path:/tmp/pip-anmXyO-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozhttpd 11:38:55 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinfo 11:38:55 INFO - Running setup.py (path:/tmp/pip-LvTLUE-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinfo 11:38:55 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinstall 11:38:55 INFO - Running setup.py (path:/tmp/pip-G0iQn4-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinstall 11:38:55 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozleak 11:38:55 INFO - Running setup.py (path:/tmp/pip-u1xS90-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozleak 11:38:55 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozlog 11:38:55 INFO - Running setup.py (path:/tmp/pip-J9qyen-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozlog 11:38:55 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moznetwork 11:38:55 INFO - Running setup.py (path:/tmp/pip-y_LGzQ-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moznetwork 11:38:55 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprocess 11:38:55 INFO - Running setup.py (path:/tmp/pip-kFVfim-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprocess 11:38:55 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprofile 11:38:55 INFO - Running setup.py (path:/tmp/pip-QJd8dn-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprofile 11:38:55 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozrunner 11:38:56 INFO - Running setup.py (path:/tmp/pip-aXpMCz-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozrunner 11:38:56 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 11:38:56 INFO - Running setup.py (path:/tmp/pip-DW4SF3-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 11:38:56 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moztest 11:38:56 INFO - Running setup.py (path:/tmp/pip-02_mAs-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moztest 11:38:56 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozversion 11:38:56 INFO - Running setup.py (path:/tmp/pip-E7bN95-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozversion 11:38:56 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 11:38:56 INFO - Running setup.py install for manifestparser 11:38:56 INFO - Installing manifestparser script to /builds/slave/test-pgo/build/venv/bin 11:38:56 INFO - Running setup.py install for mozcrash 11:38:56 INFO - Running setup.py install for mozdebug 11:38:56 INFO - Running setup.py install for mozdevice 11:38:56 INFO - Installing sutini script to /builds/slave/test-pgo/build/venv/bin 11:38:56 INFO - Installing dm script to /builds/slave/test-pgo/build/venv/bin 11:38:56 INFO - Running setup.py install for mozfile 11:38:56 INFO - Running setup.py install for mozhttpd 11:38:56 INFO - Installing mozhttpd script to /builds/slave/test-pgo/build/venv/bin 11:38:56 INFO - Running setup.py install for mozinfo 11:38:57 INFO - Installing mozinfo script to /builds/slave/test-pgo/build/venv/bin 11:38:57 INFO - Running setup.py install for mozInstall 11:38:57 INFO - Installing moz_remove_from_system script to /builds/slave/test-pgo/build/venv/bin 11:38:57 INFO - Installing mozuninstall script to /builds/slave/test-pgo/build/venv/bin 11:38:57 INFO - Installing mozinstall script to /builds/slave/test-pgo/build/venv/bin 11:38:57 INFO - Installing moz_add_to_system script to /builds/slave/test-pgo/build/venv/bin 11:38:57 INFO - Running setup.py install for mozleak 11:38:57 INFO - Running setup.py install for mozlog 11:38:57 INFO - Installing structlog script to /builds/slave/test-pgo/build/venv/bin 11:38:57 INFO - Running setup.py install for moznetwork 11:38:57 INFO - Installing moznetwork script to /builds/slave/test-pgo/build/venv/bin 11:38:57 INFO - Running setup.py install for mozprocess 11:38:57 INFO - Running setup.py install for mozprofile 11:38:57 INFO - Installing mozprofile script to /builds/slave/test-pgo/build/venv/bin 11:38:57 INFO - Installing diff-profiles script to /builds/slave/test-pgo/build/venv/bin 11:38:57 INFO - Installing view-profile script to /builds/slave/test-pgo/build/venv/bin 11:38:57 INFO - Running setup.py install for mozrunner 11:38:57 INFO - Installing mozrunner script to /builds/slave/test-pgo/build/venv/bin 11:38:57 INFO - Running setup.py install for mozscreenshot 11:38:57 INFO - Running setup.py install for moztest 11:38:57 INFO - Running setup.py install for mozversion 11:38:58 INFO - Installing mozversion script to /builds/slave/test-pgo/build/venv/bin 11:38:58 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 11:38:58 INFO - Cleaning up... 11:38:58 INFO - Return code: 0 11:38:58 INFO - Installing None into virtualenv /builds/slave/test-pgo/build/venv 11:38:58 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:38:58 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 11:38:58 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:38:58 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:38:58 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 11:38:58 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:38:58 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 0x7f2131d71f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x285a8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2927670>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x29b68c0>, '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 0x29b77c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x29b7c50>, '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': 'a4ce256d2ec601f24a60a71e000001bc-1456774677.566774-1852363187', '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 11:38:58 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 11:38:58 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 11:38:58 INFO - Using env: {'DISPLAY': ':0', 11:38:58 INFO - 'HOME': '/home/cltbld', 11:38:58 INFO - 'LANG': 'en_US.UTF-8', 11:38:58 INFO - 'LANGUAGE': 'en_US:en', 11:38:58 INFO - 'LOGNAME': 'cltbld', 11:38:58 INFO - 'MAIL': '/var/mail/cltbld', 11:38:58 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 11:38:58 INFO - 'MOZ_NO_REMOTE': '1', 11:38:58 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 11:38:58 INFO - 'NO_EM_RESTART': '1', 11:38:58 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 11:38:58 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 11:38:58 INFO - 'PWD': '/builds/slave/test-pgo', 11:38:58 INFO - 'SHELL': '/bin/bash', 11:38:58 INFO - 'SHLVL': '1', 11:38:58 INFO - 'TERM': 'linux', 11:38:58 INFO - 'TMOUT': '86400', 11:38:58 INFO - 'USER': 'cltbld', 11:38:58 INFO - 'XDG_SESSION_COOKIE': 'a4ce256d2ec601f24a60a71e000001bc-1456774677.566774-1852363187', 11:38:58 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 11:38:58 INFO - '_': '/tools/buildbot/bin/python'} 11:38:58 INFO - Ignoring indexes: https://pypi.python.org/simple/ 11:38:58 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/manifestparser 11:38:58 INFO - Running setup.py (path:/tmp/pip-veCytQ-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/manifestparser 11:38:58 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)) 11:38:58 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozcrash 11:38:58 INFO - Running setup.py (path:/tmp/pip-822wmx-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozcrash 11:38:58 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)) 11:38:58 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdebug 11:38:58 INFO - Running setup.py (path:/tmp/pip-Z_tA5T-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdebug 11:38:58 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)) 11:38:58 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdevice 11:38:58 INFO - Running setup.py (path:/tmp/pip-a_yK2G-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdevice 11:38:58 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)) 11:38:58 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozfile 11:38:58 INFO - Running setup.py (path:/tmp/pip-pryFvG-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozfile 11:38:58 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)) 11:38:58 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozhttpd 11:38:58 INFO - Running setup.py (path:/tmp/pip-Xvut0p-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozhttpd 11:38:58 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)) 11:38:58 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinfo 11:38:58 INFO - Running setup.py (path:/tmp/pip-2Sn5N_-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinfo 11:38:58 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)) 11:38:58 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinstall 11:38:58 INFO - Running setup.py (path:/tmp/pip-EJO4tX-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinstall 11:38:58 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)) 11:38:58 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozleak 11:38:58 INFO - Running setup.py (path:/tmp/pip-zYIoBA-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozleak 11:38:58 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)) 11:38:58 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozlog 11:38:58 INFO - Running setup.py (path:/tmp/pip-fe3gxA-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozlog 11:38:59 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)) 11:38:59 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moznetwork 11:38:59 INFO - Running setup.py (path:/tmp/pip-93kRSF-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moznetwork 11:38:59 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)) 11:38:59 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprocess 11:38:59 INFO - Running setup.py (path:/tmp/pip-6yo6Lp-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprocess 11:38:59 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)) 11:38:59 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprofile 11:38:59 INFO - Running setup.py (path:/tmp/pip-3AlhsP-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprofile 11:38:59 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)) 11:38:59 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozrunner 11:38:59 INFO - Running setup.py (path:/tmp/pip-xpsnIb-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozrunner 11:38:59 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)) 11:38:59 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 11:38:59 INFO - Running setup.py (path:/tmp/pip-1HpH7F-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 11:38:59 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)) 11:38:59 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moztest 11:38:59 INFO - Running setup.py (path:/tmp/pip-bZ_XoP-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moztest 11:38:59 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)) 11:38:59 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozversion 11:38:59 INFO - Running setup.py (path:/tmp/pip-gDP9dy-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozversion 11:38:59 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)) 11:38:59 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)) 11:38:59 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)) 11:38:59 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)) 11:38:59 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)) 11:38:59 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)) 11:38:59 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.1->-r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 10)) 11:38: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 11:38: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 11:38: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 11:38: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 11:38: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 11:38: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 11:39:01 INFO - Downloading blessings-1.6.tar.gz 11:39:01 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/blessings/setup.py) egg_info for package blessings 11:39:01 INFO - Installing collected packages: blessings 11:39:01 INFO - Running setup.py install for blessings 11:39:01 INFO - Successfully installed blessings 11:39:01 INFO - Cleaning up... 11:39:01 INFO - Return code: 0 11:39:01 INFO - Done creating virtualenv /builds/slave/test-pgo/build/venv. 11:39:01 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'freeze'] 11:39:01 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip freeze 11:39:01 INFO - Reading from file tmpfile_stdout 11:39:01 INFO - Current package versions: 11:39:01 INFO - argparse == 1.2.1 11:39:01 INFO - blessings == 1.6 11:39:01 INFO - blobuploader == 1.2.4 11:39:01 INFO - docopt == 0.6.1 11:39:01 INFO - manifestparser == 1.1 11:39:01 INFO - mozInstall == 1.12 11:39:01 INFO - mozcrash == 0.16 11:39:01 INFO - mozdebug == 0.1 11:39:01 INFO - mozdevice == 0.48 11:39:01 INFO - mozfile == 1.2 11:39:01 INFO - mozhttpd == 0.7 11:39:01 INFO - mozinfo == 0.9 11:39:01 INFO - mozleak == 0.1 11:39:01 INFO - mozlog == 3.1 11:39:01 INFO - moznetwork == 0.27 11:39:01 INFO - mozprocess == 0.22 11:39:01 INFO - mozprofile == 0.28 11:39:01 INFO - mozrunner == 6.11 11:39:01 INFO - mozscreenshot == 0.1 11:39:01 INFO - mozsystemmonitor == 0.0 11:39:01 INFO - moztest == 0.7 11:39:01 INFO - mozversion == 1.4 11:39:01 INFO - psutil == 3.1.1 11:39:01 INFO - requests == 1.2.3 11:39:01 INFO - wsgiref == 0.1.2 11:39:01 INFO - Installing None into virtualenv /builds/slave/test-pgo/build/venv 11:39:01 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:39:01 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 11:39:01 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:39:01 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:39:01 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 11:39:01 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:39:01 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 0x7f2131d71f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x285a8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2927670>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x29b68c0>, '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 0x29b77c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x29b7c50>, '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': 'a4ce256d2ec601f24a60a71e000001bc-1456774677.566774-1852363187', '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 11:39:01 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 11:39:01 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 11:39:01 INFO - Using env: {'DISPLAY': ':0', 11:39:01 INFO - 'HOME': '/home/cltbld', 11:39:01 INFO - 'LANG': 'en_US.UTF-8', 11:39:01 INFO - 'LANGUAGE': 'en_US:en', 11:39:01 INFO - 'LOGNAME': 'cltbld', 11:39:01 INFO - 'MAIL': '/var/mail/cltbld', 11:39:01 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 11:39:01 INFO - 'MOZ_NO_REMOTE': '1', 11:39:01 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 11:39:01 INFO - 'NO_EM_RESTART': '1', 11:39:01 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 11:39:01 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 11:39:01 INFO - 'PWD': '/builds/slave/test-pgo', 11:39:01 INFO - 'SHELL': '/bin/bash', 11:39:01 INFO - 'SHLVL': '1', 11:39:01 INFO - 'TERM': 'linux', 11:39:01 INFO - 'TMOUT': '86400', 11:39:01 INFO - 'USER': 'cltbld', 11:39:01 INFO - 'XDG_SESSION_COOKIE': 'a4ce256d2ec601f24a60a71e000001bc-1456774677.566774-1852363187', 11:39:01 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 11:39:01 INFO - '_': '/tools/buildbot/bin/python'} 11:39:02 INFO - Ignoring indexes: https://pypi.python.org/simple/ 11:39:02 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)) 11:39:02 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)) 11:39:02 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)) 11:39:02 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)) 11:39:02 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)) 11:39:02 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)) 11:39:02 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)) 11:39:02 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)) 11:39:02 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)) 11:39:02 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)) 11:39:02 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)) 11:39:02 INFO - Cleaning up... 11:39:02 INFO - Return code: 0 11:39:02 INFO - Installing jsonschema into virtualenv /builds/slave/test-pgo/build/venv 11:39:02 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://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')]} 11:39:02 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 11:39:02 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:39:02 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://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')]} 11:39:02 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 11:39:02 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:39:02 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 0x7f2131d71f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x285a8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2927670>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x29b68c0>, '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 0x29b77c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x29b7c50>, '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': 'a4ce256d2ec601f24a60a71e000001bc-1456774677.566774-1852363187', '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 11:39:02 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 11:39:02 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 11:39:02 INFO - Using env: {'DISPLAY': ':0', 11:39:02 INFO - 'HOME': '/home/cltbld', 11:39:02 INFO - 'LANG': 'en_US.UTF-8', 11:39:02 INFO - 'LANGUAGE': 'en_US:en', 11:39:02 INFO - 'LOGNAME': 'cltbld', 11:39:02 INFO - 'MAIL': '/var/mail/cltbld', 11:39:02 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 11:39:02 INFO - 'MOZ_NO_REMOTE': '1', 11:39:02 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 11:39:02 INFO - 'NO_EM_RESTART': '1', 11:39:02 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 11:39:02 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 11:39:02 INFO - 'PWD': '/builds/slave/test-pgo', 11:39:02 INFO - 'SHELL': '/bin/bash', 11:39:02 INFO - 'SHLVL': '1', 11:39:02 INFO - 'TERM': 'linux', 11:39:02 INFO - 'TMOUT': '86400', 11:39:02 INFO - 'USER': 'cltbld', 11:39:02 INFO - 'XDG_SESSION_COOKIE': 'a4ce256d2ec601f24a60a71e000001bc-1456774677.566774-1852363187', 11:39:02 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 11:39:02 INFO - '_': '/tools/buildbot/bin/python'} 11:39:02 INFO - Ignoring indexes: https://pypi.python.org/simple/ 11:39:02 INFO - Downloading/unpacking jsonschema 11:39:02 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 11:39:02 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 11:39:02 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 11:39:02 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 11:39:02 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 11:39:02 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 11:39:04 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 11:39:04 INFO - Downloading/unpacking functools32 (from jsonschema) 11:39:04 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 11:39:04 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 11:39:04 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 11:39:04 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 11:39:04 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 11:39:04 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 11:39:04 INFO - Downloading functools32-3.2.3-2.tar.gz 11:39:04 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/functools32/setup.py) egg_info for package functools32 11:39:04 INFO - warning: no files found matching '*.txt' 11:39:04 INFO - no previously-included directories found matching 'build' 11:39:04 INFO - no previously-included directories found matching 'dist' 11:39:04 INFO - no previously-included directories found matching '.git*' 11:39:04 INFO - Installing collected packages: jsonschema, functools32 11:39:04 INFO - Running setup.py install for functools32 11:39:04 INFO - warning: no files found matching '*.txt' 11:39:04 INFO - no previously-included directories found matching 'build' 11:39:04 INFO - no previously-included directories found matching 'dist' 11:39:04 INFO - no previously-included directories found matching '.git*' 11:39:04 INFO - Successfully installed jsonschema functools32 11:39:04 INFO - Cleaning up... 11:39:04 INFO - Return code: 0 11:39:04 INFO - Installing flake8 into virtualenv /builds/slave/test-pgo/build/venv 11:39:04 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:39:04 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 11:39:04 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:39:04 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:39:04 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 11:39:04 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:39:04 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 0x7f2131d71f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x285a8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2927670>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x29b68c0>, '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 0x29b77c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x29b7c50>, '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': 'a4ce256d2ec601f24a60a71e000001bc-1456774677.566774-1852363187', '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 11:39:04 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 11:39:04 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 11:39:04 INFO - Using env: {'DISPLAY': ':0', 11:39:04 INFO - 'HOME': '/home/cltbld', 11:39:04 INFO - 'LANG': 'en_US.UTF-8', 11:39:04 INFO - 'LANGUAGE': 'en_US:en', 11:39:04 INFO - 'LOGNAME': 'cltbld', 11:39:04 INFO - 'MAIL': '/var/mail/cltbld', 11:39:04 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 11:39:04 INFO - 'MOZ_NO_REMOTE': '1', 11:39:04 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 11:39:04 INFO - 'NO_EM_RESTART': '1', 11:39:04 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 11:39:04 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 11:39:04 INFO - 'PWD': '/builds/slave/test-pgo', 11:39:04 INFO - 'SHELL': '/bin/bash', 11:39:04 INFO - 'SHLVL': '1', 11:39:04 INFO - 'TERM': 'linux', 11:39:04 INFO - 'TMOUT': '86400', 11:39:04 INFO - 'USER': 'cltbld', 11:39:04 INFO - 'XDG_SESSION_COOKIE': 'a4ce256d2ec601f24a60a71e000001bc-1456774677.566774-1852363187', 11:39:04 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 11:39:04 INFO - '_': '/tools/buildbot/bin/python'} 11:39:05 INFO - Ignoring indexes: https://pypi.python.org/simple/ 11:39:05 INFO - Downloading/unpacking flake8 11:39:05 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 11:39:05 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 11:39:05 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 11:39:05 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 11:39:05 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 11:39:05 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 11:39:06 INFO - Downloading flake8-2.5.0-py2.py3-none-any.whl 11:39:06 INFO - Downloading/unpacking mccabe>=0.2.1,<0.4 (from flake8) 11:39:06 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 11:39:06 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 11:39:06 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 11:39:06 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 11:39:06 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 11:39:06 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 11:39:07 INFO - Downloading mccabe-0.3.1-py2.py3-none-any.whl 11:39:07 INFO - Downloading/unpacking pyflakes>=0.8.1,<1.1 (from flake8) 11:39:07 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 11:39:07 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 11:39:07 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 11:39:07 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 11:39:07 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 11:39:07 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 11:39:07 INFO - Downloading/unpacking pep8>=1.5.7,!=1.6.0,!=1.6.1,!=1.6.2 (from flake8) 11:39:07 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 11:39:07 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 11:39:07 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 11:39:07 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 11:39:07 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 11:39:07 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 11:39:07 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/pep8/setup.py) egg_info for package pep8 11:39:07 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 11:39:07 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 11:39:07 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 11:39:07 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 11:39:07 INFO - no previously-included directories found matching 'docs/_build' 11:39:07 INFO - Installing collected packages: flake8, mccabe, pyflakes, pep8 11:39:07 INFO - Running setup.py install for pep8 11:39:07 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 11:39:07 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 11:39:07 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 11:39:07 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 11:39:07 INFO - no previously-included directories found matching 'docs/_build' 11:39:07 INFO - Installing pep8 script to /builds/slave/test-pgo/build/venv/bin 11:39:07 INFO - Successfully installed flake8 mccabe pyflakes pep8 11:39:07 INFO - Cleaning up... 11:39:07 INFO - Return code: 0 11:39:07 INFO - Running post-action listener: _resource_record_post_action 11:39:07 INFO - Running post-action listener: _start_resource_monitoring 11:39:07 INFO - Starting resource monitoring. 11:39:07 INFO - ##### 11:39:07 INFO - ##### Running install step. 11:39:07 INFO - ##### 11:39:07 INFO - Running pre-action listener: _resource_record_pre_action 11:39:07 INFO - Running main action method: install 11:39:07 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'freeze'] 11:39:07 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip freeze 11:39:08 INFO - Reading from file tmpfile_stdout 11:39:08 INFO - Detecting whether we're running mozinstall >=1.0... 11:39:08 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/mozinstall', '-h'] 11:39:08 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/mozinstall -h 11:39:08 INFO - Reading from file tmpfile_stdout 11:39:08 INFO - Output received: 11:39:08 INFO - Usage: mozinstall [options] installer 11:39:08 INFO - Options: 11:39:08 INFO - -h, --help show this help message and exit 11:39:08 INFO - -d DEST, --destination=DEST 11:39:08 INFO - Directory to install application into. [default: 11:39:08 INFO - "/builds/slave/test-pgo"] 11:39:08 INFO - --app=APP Application being installed. [default: firefox] 11:39:08 INFO - mkdir: /builds/slave/test-pgo/build/application 11:39:08 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'] 11:39:08 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 11:39:24 INFO - Reading from file tmpfile_stdout 11:39:24 INFO - Output received: 11:39:24 INFO - /builds/slave/test-pgo/build/application/firefox/firefox 11:39:24 INFO - Running post-action listener: _resource_record_post_action 11:39:24 INFO - ##### 11:39:24 INFO - ##### Running run-tests step. 11:39:24 INFO - ##### 11:39:24 INFO - Running pre-action listener: _resource_record_pre_action 11:39:24 INFO - Running main action method: run_tests 11:39:24 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/python', '--version'] 11:39:24 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/python --version 11:39:24 INFO - Python 2.7.3 11:39:24 INFO - Return code: 0 11:39:24 INFO - grabbing minidump binary from tooltool 11:39:24 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')]} 11:39:24 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 0x29b68c0>, '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 0x29b77c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x29b7c50>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test-pgo/build', 'privileged': False}, attempt #1 11:39:24 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 11:39:24 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 11:39:24 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 11:39:24 INFO - Return code: 0 11:39:24 INFO - Chmoding /builds/slave/test-pgo/build/linux64-minidump_stackwalk to 0755 11:39:24 INFO - mkdir: /builds/slave/test-pgo/build/blobber_upload_dir 11:39:24 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test-pgo/build/blobber_upload_dir 11:39:24 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test-pgo/build/linux64-minidump_stackwalk 11:39:24 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test-pgo/build/blobber_upload_dir 11:39:24 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/flake8', '/builds/slave/test-pgo/build/tests/talos/talos'] 11:39:24 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/flake8 /builds/slave/test-pgo/build/tests/talos/talos 11:39:25 INFO - Return code: 0 11:39:25 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/JVZ9Gd0AQk6ucaWKcJEwOA/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-062', '--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 11:39:25 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/JVZ9Gd0AQk6ucaWKcJEwOA/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-062 --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 11:39:25 INFO - Using env: {'DISPLAY': ':0', 11:39:25 INFO - 'HOME': '/home/cltbld', 11:39:25 INFO - 'LANG': 'en_US.UTF-8', 11:39:25 INFO - 'LANGUAGE': 'en_US:en', 11:39:25 INFO - 'LOGNAME': 'cltbld', 11:39:25 INFO - 'MAIL': '/var/mail/cltbld', 11:39:25 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test-pgo/build/blobber_upload_dir', 11:39:25 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test-pgo/build/linux64-minidump_stackwalk', 11:39:25 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 11:39:25 INFO - 'MOZ_NO_REMOTE': '1', 11:39:25 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test-pgo/build/blobber_upload_dir', 11:39:25 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 11:39:25 INFO - 'NO_EM_RESTART': '1', 11:39:25 INFO - 'PATH': '/builds/slave/test-pgo/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 11:39:25 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 11:39:25 INFO - 'PWD': '/builds/slave/test-pgo', 11:39:25 INFO - 'PYTHONPATH': '/builds/slave/test-pgo/build/tests/talos', 11:39:25 INFO - 'SHELL': '/bin/bash', 11:39:25 INFO - 'SHLVL': '1', 11:39:25 INFO - 'TERM': 'linux', 11:39:25 INFO - 'TMOUT': '86400', 11:39:25 INFO - 'USER': 'cltbld', 11:39:25 INFO - 'XDG_SESSION_COOKIE': 'a4ce256d2ec601f24a60a71e000001bc-1456774677.566774-1852363187', 11:39:25 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 11:39:25 INFO - '_': '/tools/buildbot/bin/python'} 11:39:25 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/JVZ9Gd0AQk6ucaWKcJEwOA/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-062', '--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 11:39:25 INFO - mozversion application_buildid: 20160229083150 11:39:25 INFO - mozversion application_changeset: 6af962bff65de440a88387256ce311c5e5e2e440 11:39:25 INFO - mozversion application_display_name: Nightly 11:39:25 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 11:39:25 INFO - mozversion application_name: Firefox 11:39:25 INFO - mozversion application_remotingname: firefox 11:39:25 INFO - mozversion application_repository: https://hg.mozilla.org/integration/fx-team 11:39:25 INFO - mozversion application_vendor: Mozilla 11:39:25 INFO - mozversion application_version: 47.0a1 11:39:25 INFO - mozversion platform_buildid: 20160229083150 11:39:25 INFO - mozversion platform_changeset: 6af962bff65de440a88387256ce311c5e5e2e440 11:39:25 INFO - mozversion platform_repository: https://hg.mozilla.org/integration/fx-team 11:39:25 INFO - mozversion platform_version: 47.0a1 11:39:25 INFO - using testdate: 1456774765 11:39:25 INFO - actual date: 1456774765 11:39:25 INFO - starting webserver on 'localhost:50410' 11:39:25 INFO - SUITE-START | Running 2 tests 11:39:25 INFO - TEST-START | dromaeo_css 11:39:25 INFO - operating with platform_type : linux_ 11:39:25 INFO - Initialising browser for dromaeo_css test... 11:39:25 INFO - TEST-INFO | started process 10083 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpOJOqrc/profile http://localhost:50410/getInfo.html) 11:39:29 INFO - PROCESS | 10083 | __metrics Screen width/height:1600/1200 11:39:29 INFO - PROCESS | 10083 | colorDepth:24 11:39:29 INFO - PROCESS | 10083 | Browser inner width/height: 1024/697 11:39:29 INFO - PROCESS | 10083 | __metrics 11:39:30 INFO - PROCESS | 10083 | JavaScript error: resource://app/modules/WebappManager.jsm, line 48: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 11:39:30 INFO - PROCESS | 10083 | nsHttpConnectionMgr::Shutdown() ProcessNextEvent 11:39:30 INFO - PROCESS | 10083 | nsHttpConnectionMgr::Shutdown() ProcessNextEvent 11:39:30 INFO - PROCESS | 10083 | nsHttpConnectionMgr::Shutdown() ProcessNextEvent 11:39:30 INFO - PROCESS | 10083 | nsHttpConnectionMgr::Shutdown() ProcessNextEvent 11:39:30 INFO - PROCESS | 10083 | nsHttpConnectionMgr::Shutdown() ProcessNextEvent 11:39:30 INFO - PROCESS | 10083 | nsHttpConnectionMgr::Shutdown() ProcessNextEvent 11:39:30 INFO - PROCESS | 10083 | 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. 11:39:31 INFO - TEST-INFO | 10083: exit 0 11:39:31 INFO - Browser initialized. 11:39:31 INFO - Running cycle 1/1 for dromaeo_css test... 11:39:31 INFO - TEST-INFO | started process 10181 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpOJOqrc/profile -tp file:/builds/slave/test-pgo/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 11:39:43 INFO - PROCESS | 10181 | RSS: Main: 153382912 11:39:43 INFO - PROCESS | 10181 | 11:40:34 INFO - PROCESS | 10181 | 1456774834820 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] 11:42:42 INFO - PROCESS | 10181 | Cycle 1(1): loaded http://localhost:50410/tests/dromaeo/cssquery-dojo.html (next: http://localhost:50410/tests/dromaeo/cssquery-ext.html) 11:42:43 INFO - PROCESS | 10181 | RSS: Main: 252768256 11:42:43 INFO - PROCESS | 10181 | 11:45:45 INFO - PROCESS | 10181 | Cycle 1(1): loaded http://localhost:50410/tests/dromaeo/cssquery-ext.html (next: http://localhost:50410/tests/dromaeo/cssquery-jquery.html) 11:45:46 INFO - PROCESS | 10181 | RSS: Main: 242221056 11:45:46 INFO - PROCESS | 10181 | 11:48:48 INFO - PROCESS | 10181 | Cycle 1(1): loaded http://localhost:50410/tests/dromaeo/cssquery-jquery.html (next: http://localhost:50410/tests/dromaeo/cssquery-mootools.html) 11:48:48 INFO - PROCESS | 10181 | RSS: Main: 237527040 11:48:48 INFO - PROCESS | 10181 | 11:51:50 INFO - PROCESS | 10181 | Cycle 1(1): loaded http://localhost:50410/tests/dromaeo/cssquery-mootools.html (next: http://localhost:50410/tests/dromaeo/cssquery-prototype.html) 11:51:51 INFO - PROCESS | 10181 | RSS: Main: 218316800 11:51:51 INFO - PROCESS | 10181 | 11:54:53 INFO - PROCESS | 10181 | Cycle 1(1): loaded http://localhost:50410/tests/dromaeo/cssquery-prototype.html (next: http://localhost:50410/tests/dromaeo/cssquery-yui.html) 11:54:54 INFO - PROCESS | 10181 | RSS: Main: 221077504 11:54:54 INFO - PROCESS | 10181 | 11:57:57 INFO - PROCESS | 10181 | Cycle 1(1): loaded http://localhost:50410/tests/dromaeo/cssquery-yui.html (next: http://localhost:50410/tests/dromaeo/cssquery-dojo.html) 11:57:57 INFO - PROCESS | 10181 | RSS: Main: 306094080 11:57:57 INFO - PROCESS | 10181 | 11:57:57 INFO - PROCESS | 10181 | __start_tp_report 11:57:57 INFO - PROCESS | 10181 | _x_x_mozilla_page_load 11:57:57 INFO - PROCESS | 10181 | _x_x_mozilla_page_load_details 11:57:57 INFO - PROCESS | 10181 | |i|pagename|runs| 11:57:57 INFO - PROCESS | 10181 | |0;dojo.html;3068.401661675973;3104.689531046894;3146.9213269668257;3150.6061742282213;3169.6988786065317;4925.901481970367;4949.257611358298;5011.724355160465;5039.571636410905;5052.343195384595;5027.4469808321055;5037.647364684473;5040.790210349517;5066.822661206858;5100.362454693163;4541.954580454186;4560.931586026212;4602.263637817933;4658.091672123937;4674.90650186996;4637.095766325551;4666.346711460398;4677.204875171229;4679.625629949596;4706.458757242909;4562.270036794131;4603.10239503297;4671.532846715319;4697.436307643071;4731.290306454025;4664.86005419838;4677.204875171229;4684.273937539687;4694.530546945278;4720.480747117815;4636.165490211761;4647.302904564309;4652.139354219446;4678.485366609671;4703.2239680452685;4871.951280487186;4886.926696099561;4915.115279249733;4984.22744474607;4993.650444468889;5376.1398176292;5380.91928621071;5385.192221166856;5389.541888939445;5390;5389.056915039852;5398.946010539884;5416.458354164592;5464.207689884945;5480.068388373986;5090;5114.360704911923;5120.513551212629;5173.198154286091;5178.171492561172;5572.136318870582;5591.161325801162;5591.4688104629995;5596.048671725816;5600.075987462104;5248.370195576479;5337.359516857924;5377.193420986883;5405.081136206854;5414.296141501658;5499.312585926759;5502.367227768857;5511.889762204733;5521.1442226454965;5571.860703482445;5437.673739575638;5448.046591846411;5460.481254280837;5461.918071228855;5465.180222966507;5285.709285989307;5375.865603359869;5452.645578037414;5489.737360407049;5498.367687715964;4151.750894946313;4161.97919010403;4170.207660544487;4199.622034016953;4208.894777630522;3750.1937083526627;3770.170562476251;3777.0746167189213;3802.8478860845257;3804.2962052020466;4996.7501624918605;5092.414372347153;5131.794728210904;5142.665726727751;5185.455527169668;5364.409914909357;5382.273393091961;5389.83830485086;5399.055165346049;5413.783448662089;4954.256861470736;5025.84922452327;5056.772445239973;5058.215976523645;5147.40804807452;4564.657650676212;4603.194440972817;4610.10103029906;4643.814247430065;4650.139724151043;5579.302587176603;5624.695337292669;5626.662400255997;5629.352624448159;5681.687507187145;5339.3058902342445;5353.946460535345;5363.463653634605;5365.785368585213;5370.624056316176;5649.4633009864;5650.0959846424375;5653.745581448762;5672.262605861211;5694.032014557618;5278.920816187837;5280.471952804689;5283.498067683564;5283.577313814809;5313.123334649739;5251.5011073949445;5339.866503337447;5354.812581559627;5356.143017117242;5389.973050134724;5267.604929630216;5272.736363181749;5277.261183434245;5277.815276465305;5301.893962120659;5215.687058776485;5215.843524694265;5217;5238.895222095461;5264.736763161904;5160.200168973815;5161.7677204526635;5162.586993040472;5166.844994650167;5183.11886979222;5278.155495120763;5314.256004159498;5315.548178404879;5333.893322133613;5364.678119312697;5199.986002729432;5218.947810521846;5229.921551176812;5265.131253343308;5270.841874743764 11:57:57 INFO - PROCESS | 10181 | |1;ext.html;493.117319997205;518.885845114075;526.1397614899643;532.4701921588021;552.1469329885329;27879.163625091256;35546.466802997944;36116.81941590295;36225;36294.8185259074;38147.427788583125;38867.805660971724;38871;38905.610943890555;38911.61088389115;7197.316254955797;8327.958360208191;8572.399932004762;8585.742427727178;9947;9987.201023918069;10169;10175.084242418181;10184;10214.846777298346;10147;10169;10241;10245.590176392972;10250.948745256263;10112.797744045114;10185.643502477415;10196.082352588302;10201.234907381902;10201.591936322538;9973.700788976343;10371.948140259326;10375;10377.117944974687;10389.168866490663;39753.60246397528;40373.79813100945;40465;40567.79716101401;40601.59398406008;3160.336329370835;3190.88831890885;3210.8611126284372;3212.27723762154;3316.9834150829092;29839.25401864949;30326.393472130654;30712.38575228483;30714.078577642482;30781;3369.629340772513;3393.7624366294367;3398.5581874356176;3442.915481623306;3531.0819187011307;263663;264887.6755616229;265803;266192;266221;41424.792876035426;59103.68066874002;59418;59484.7025764877;59494.405055949755;40013.1990760644;40218.39672404916;40278.59721402807;40367.39448908269;40384.79807600943;12662.176958497668;12681.619551413472;12687;12714.745705086032;12730.872691272969;10703.83944240837;10736.248462607698;10751.08615767653;10752.354858708502;10757.031867131996;13994.930025349808;14095.577132686036;14096.731294183573;14178.220197889008;14216.928915355564;5592.328920529562;5624.240727501817;5673.063944449203;5686.800961966312;5762.827115186551;907.7594437474074;956.2111258211864;963.5134257200069;1054.7626783973544;1073.9516721747384;26660.200193994213;27081.45837083247;27157.185284441497;27192.45615087687;27391.589126163122;845.556083056388;1003.859459675646;1015.4719545836124;1015.97460063499;1040.095117247999;12605.369731513387;12816.871831281755;12988.675283117998;13059.934700326437;13181.670458238428;292867;294187;295781;297187;298028;51641;52300.21549676758;52784.47215527796;52881.7355913218;53240;1265.8354413926131;1273.1915233826587;1295.9481620735064;1302.1991475242846;1429.6068581140269;25338.493230134925;25732.61401079023;26005;26031.869840650674;26421.73578264193;43487;43945;43985.34021989737;44041.559584403745;44079.559204407546;269554;272568;275805;278753;279040;27472.076954612985;30977.380452390375;31590.52614210743;31853.681463185072;32551;37375;37628.24743505169;38334;38391.6160838388;38718.80640596779;31945.68054319427;32030.839845800623;32309;32618.34763304673;33007.174820629676;32258.35483290368;38046.809765950995;41218;41983;42145.36781948212;35528.111797205274;35950.28099437944;36285.818570908035;36362.63637363593;36386.81806591056;32319.51520727144;32696.673033270315;32732.672673272962;32741;32823.83406861645;23727.881360593088;23771.881140594185;23792.762072379748;23913.40216494532;24133.276001719976 11:57:57 INFO - PROCESS | 10181 | |2;jquery.html;354.9882833923317;355.2486491071384;363.83991043940665;365.8042947023343;368.98893033209015;16600;16901.661966760657;17603.559911002216;17962;17990.910045449753;10930.672079837597;11227.887721122786;11260.774784504305;11276.985071343577;16551.751723724123;4847.781849816767;4964.776585053682;4987.127252730776;4999.675021123633;5003.349564556603;4933.777979990909;4994.900101997958;5019.272205530196;5043.924341134886;5051.772670229849;5012.573931215833;5025.648204625678;5027.949720502803;5039.546440820325;5096.847094587169;5077.111505486543;5259.737013149346;5470.452954704538;5474.768177160147;5488.506034456878;5241;5250.921236181461;5252.527272545489;5257;5265.183896496049;13787.793183102262;17518.474445766646;21045.369328833895;21070.367888963356;21091;2056.7120603115577;2146.8604540704805;2150.2796563151364;2209.668549717539;2358.2099996501192;9469.715908522756;9632.566534505893;9733.90266097337;9847.753806154831;10002.59989600415;1712.2808420463311;1820.6722789897813;1843.8432733217692;1859.2191279662575;1864.7482589850333;46915.53084469146;48977.75511122457;61587;61627.38372616261;63635;10195.694129176136;10266.819315778781;10365.533550990072;10366.688999330032;10367.429791361397;13502.91976641886;13668.248246346546;13702.588922332347;13707.862921370857;13742.450301988009;6525.608463492111;6571.934280657132;7572.167061623217;7774.766756997299;7792.259735325135;7413.332800048021;7453.627318634047;7566.432517561095;7577.052868391451;7600.657970391346;4474.910501789946;4563.338315944169;4568.086382723469;4588.95411045892;4624.560666736655;1839.202047771348;1857.5634725839418;1893.848492120627;1899.905004749757;1901.7242499837446;811.7808191788184;820.2658620534708;873.1752779757479;919.1451949686856;930.9255259579218;15360.539183824503;15869.20653967297;15934.840651593568;16122.435714749927;16194.919025405034;910.3218102513538;947.7820101376584;970.427447805798;1032.7056788815303;1037.600523798328;9117.225035871892;9232.584533696;9293.210077143518;9316.043630837465;9567.712968610953;414221;419793;421153;430864;441524;72537;73783.63108184424;75446.62276688582;76506;77656.61171694106;942.3921570586933;1012.291396022787;1049.3861091261697;1050.9527071281964;1051.264115119404;14177.23543908969;14929.701405972037;15062.849371506583;15211.92394038067;15492.147931863856;33393.33213335768;33413.832930836164;33492.1626959328;34142.82928585341;34370.82814585911;44912.77543612261;47217.76391118023;48594;48673.26990095081;50369.244461332375;7843.4117441191;7938;8034.116247212685;8061.072976607765;8196.42625016243;11188.83216751733;12576.30830304342;12637.87362126367;12653.620391388273;12837.101402901708;10248.897511024794;10465.319754215952;10755.784884302426;10817.080548153495;11073.667789966314;5157.303763991813;9587.856182157133;9625.989271126711;10004.599816007278;10598.947005264925;10159.542820572944;11199.832002520132;11248.88751112511;11436.885631143583;11481.138914581607;7318.96340518294;7469.626518674153;7693.88459173124;7769.339606133542;7982.680692772224;10362.119219866396;10723.94638026836;10822.188335874998;10898.618548350769;11097.112231021338 11:57:57 INFO - PROCESS | 10181 | |3;mootools.html;1369.650739061539;1496.970060598788;1521.163360151916;1683.730603103503;1842.5577861313288;6794.66026698665;7478.102627684679;7642.465027448081;7657.425693073021;7676.347510461604;7157.713691452335;7395.260473952616;7408.777736667895;7415.295546923047;7422.554646721201;1937.8740381875205;2183.410479170623;2210.403191138396;2235.765244649313;2243.9439014024615;2202.933911982635;2227.4988127671227;2227.498812767131;2228.687983682286;2229.7547269800307;2165.436986383536;2246.2475070851283;2255.188132272389;2255.796978271955;2257.1761307122947;2164.2208804830248;2204.526026904215;2208.7349518057777;2227.9665805012937;2230.828814872189;2172.283146561631;2180.738311402626;2192.572448372568;2199.7580266170708;2223.6664500325082;7581.203973582805;7615.390768738543;7620.161782203953;7635.160132385433;7647.235276472364;4494.8202071917085;4548.363229147922;4575.977120114411;4609.423822022247;4620.907581848344;2934.1344303430537;2978.8361640109783;3013.382256637384;3019.1697283247063;3060.6786287439945;905.5970093308415;923.1599244687302;931.9813603727888;937.1565590968115;955.6320816485634;10329.276950613461;10333.121684656813;10360.119389851796;10375.740606484822;10421.739456513573;3990.920181596352;4094.058366575645;4113.691473139466;4156.397322388237;4158.9376159357025;8778.209961103532;8839.734807955772;8854.86717699235;8861.424007439497;8879.955600222087;4051.230266249403;4622.514635963243;4661.557152070548;4676.368690226844;4677.041206552649;4075.898102547401;4119;4137.131202447459;4149.356849688304;4177.164567086595;3499.807510586942;3553.502509648651;3557.1107223194203;3589;3598.9100272493397;1073.259450978822;1077.6066735641434;1084.1001968366238;1084.6366467233408;1096.786126705285;1329.6144118205805;1339.5445548513358;1368.6783605852618;1371.1156304183746;1387.5421111033336;7191.568505889559;7373.410127189812;7385.926140738631;7385.9630701846145;7392.408607311402;476.96184305255497;490.4800911034315;491.75658049265127;492.83736366998806;502.06866263082185;5659.349174844946;5695.629784064023;5701.372848986691;5745.9425405745405;5751.539876809845;8474.915250847536;9013.954930225307;9078.137576930181;9083;9119.768831207835;8879.511626860585;8994.730158095137;9012.27901767857;9028.36801423894;9049.276057915351;6911.89632155518;6967.372936435745;6998.475114366341;7009.1589009319205;7126.429885609139;6722.697478613572;6751.86496270062;6772.051912732123;6787.762428314985;6792.728290868507;7867.84264314722;8085.393595480245;8086.5148091114725;8168.305694015838;8216.21945915137;8113.432059755761;8296.25333719944;8424.620892059995;8431.114732953198;8432.915670843213;6339.936600634119;6432.742690292524;6595.868082638416;6671.33286671329;6674.399304062657;7145.1425828900865;7172.246914073947;7182.569045857265;7198.49610527279;7251.782446526613;6503.382178693017;6676.632785196861;6704.229013663296;6778.288279730755;6804.489663275175;6507.219133703986;6573.605583664996;6588.8352791180605;6637.037629543785;6679.899801502884;6514.3811337922825;6605.735770569124;6610.206775186816;6652.83367915806;6677.76627818024;6306.117143599808;6366.93633063682;6369.299377068426;6393.1688880445245;6416.358364163546;6219.626822390671;6233.283172435228;6273;6274.215723034621;6276.058591211355 11:57:57 INFO - PROCESS | 10181 | |4;prototype.html;321.5915786950573;327.2326394604652;328.5941861800677;334.2145957001046;334.76900938352543;5837.474627283544;5872.265966754156;5886.381929897363;5900.675462849542;5901.085331773571;5798.5361171106315;5800.245968024162;5802.332731735852;5805.709714514268;5816.302043754745;4311;4459.197344477992;4520.3219517072375;4558.361829343895;4588.518205588415;4545.545445455461;4565.292379681138;4568.109218702338;4568.109218702354;4573.222552166123;4451.287793952968;4504.369388285642;4504.729716217021;4514.074614703978;4536.160810250098;4282.892927676802;4356.411884395614;4443.888902777424;4471.39636149119;4471.6646251531265;3915.745476544044;3920.5687374388795;3930.9017274568077;3934.527856657191;3949.2891279569667;5550.5013646315265;5553.666779993213;5572.637778544382;5572.804951826707;5573.972130139324;5188.507091826271;5189.818356357509;5189.870253243699;5192.299039629639;5195.064888320101;6091.360407157274;6119.204503414572;6120.846978825521;6130.724117414727;6150.015997440433;4088.8160032798596;4188.434561334211;4191.036061705794;4349.13017396522;4378.452693413324;6354.3010268870385;6423.454006409461;6443.9355606443805;6446.097546343516;6456.548041637087;4326.242907491176;4357.433533640607;4369.475662920407;4375.934360984587;4378.452693413324;4416.823327066945;4423.159599676052;4423.270160423494;4425.159219748302;4425.491068527096;5091.541761241432;5103.157978933435;5134.717590532557;5136;5145.819896303611;6010.9699451502465;6229.314775374705;6235.657038862815;6242.625442473466;6253.937460625427;1523.603862995629;1533.9769903451456;1534.77745726869;1537.3927298716944;1537.9000364976241;930.3208657679932;1004.3321191407632;1015.7968406318765;1029.2332212501585;1048.4286064094933;5838.737256823453;5888.705564721747;5890.646561206256;5895.616784908967;5901.645901245939;6309.842253943596;6310.368963103745;6312.210973628296;6321.399467050623;6327.177466929362;5877.500412464989;5890.67601281925;5893.705314734246;5893.911591326134;5908.556858235564;3384.0693809202176;3401.693847553732;3406.7615266931075;3410.556627638391;3413.9829300853335;6569.638669873108;6618.106555615027;6653.600783952978;6793.830154246085;6817.488688348394;6596.736130554724;6610.438112760469;6619.635920024349;6633.1045308882685;6652.234992975773;6762.425193858577;6766.391024807693;6792.966035169792;6800.183977922681;6823.181218253742;6437.967810160919;6457.515686323451;6463.062855885776;6471.449926756279;6485.286618472059;6218.968905155445;6404.327545607831;6416.230052393743;6418.005209192583;6422.967885160731;6790.117284752951;6807.523473357016;6810.182778066465;6816.182058153054;6826.078479405217;4279.679024073144;4286.764227967492;4288.442502474658;4294.57054294568;4300.462442194726;6458;6461.19235095613;6465.450436712932;6468.288488266193;6473.741050357933;6265.342139075331;6269.623822570478;6277.2153480814895;6287.088372186099;6293.150424692608;6082.452579267887;6243.594166379171;6268.993921944933;6298.370162983665;6307.211598550181;6137.202163718688;6155.107509411021;6170;6170.629762214281;6177.320494745664;6288.371162883675;6294.15028971083;6296.464800492009;6300.936990630218;6301.6534090625455;5945.672987985702;6001.819945401645;6146.416090471398;6147.170132032118;6150.231221097363 11:57:57 INFO - PROCESS | 10181 | |5;yui.html;696.6255340051501;756.4213376766772;802.7545694496813;820.9466384684995;845.3110714767466;13800.861991380083;13962.092463989833;13966.720665586696;13979.51071712489;14016.369263383147;13055.477780888777;13075.084744067919;13093.279869607168;13094.148880322773;14445;831.5343407691681;844.3456321350941;849.7280870121564;850.6639877248483;850.8936382952131;828.6519661742083;838.6771093129158;838.9161083891623;839;839.1734141870253;896.6144557840126;898.8427025270585;899.6851102114273;899.8605216191501;900.4867225681364;891.8617614269799;899.6401439424217;900.0144841398658;900.428228075177;901.0178904993523;659.7427003468651;662.9668516574152;663.2538394306405;663.6880666086931;664.4750646988873;13743.931280343535;13764.449422023106;13766.380512876945;13767.518136865261;13783.173009619355;12511.93744031274;12668.36658167088;12784.105112642119;12910.87089129106;13016.804747928789;10422.84365734507;10449.738756531071;10644.361338319726;10744.785104297871;11191.384473853936;3627.147620309225;3647.3832480260194;3670.229251857113;3774.8112594370173;3781.829817658212;47597.76201118972;47681.76159119217;47686.523134768555;47701.522984770054;47723.76138119322;9647.758806029906;10001.599936002624;10123.1901447884;10176.694699159038;10522.631707890187;18885.527861803566;18896.149673264736;18914.24343026291;18924;18973.335933242546;7369.373603243677;7406.259374062658;7511.211322811027;7636.350910172698;7738.690452381954;4172.603602657743;4296.806643701041;4348.717333373321;4421.712588681726;4624.722516649012;3000.489916714164;3004.278973046497;3021.320202954362;3023.2441889527618;3027.197792584967;525.0889706359463;541.0207524380883;541.3476760503584;542.7286356821589;543.665645627936;495.7496464285513;543.7525925703795;566.6345207341242;655.131950166032;661.4311691944923;7763.456558040996;7999.5600241986085;8070.475419097857;8149.062857771313;8209.425340226127;619.9411055949678;628.9811305660837;643.5077165968038;656.55760570677;657.1687310408279;3667.7357152134623;3796.7788843526846;3806.238752249506;3825.827837747308;3850.5367960174954;53694.7315263429;53859.73070134624;54703;54718.726406367714;54906.72546637241;47094.76452617784;47631;48059.75970120197;48585.5141448581;49218.507814921395;39003.41494877579;42876.35685464721;43707;44678.55321446809;46348.7682561585;7931.405144614062;8110.594470276581;8132.67469301245;8170.509769413854;8313.168683131638;32357.51463727999;33470.832645836614;33666.66333336733;34266.14334641654;34301.65698342985;39341.803290983364;39399.40900886546;42240.577594223665;42361.57638423576;43171.35242971295;10870.782584348426;11230.55077796879;11283.887161128283;11503.309801411942;11582.420878956187;11845.11161662896;11940.70148246266;12298.385080745747;12384.75230495403;12490.437930293341;10832.783344332911;11071.446427678746;11149.609763658233;11185.88814111881;11329.263597866113;11220.270682405617;11599.130065244972;11657.53369865196;11867.465964031466;11938.58214962472;10070;10304.536295866554;10452.843207352047;10456.686299410725;10462.947685261524;9252.814943700954;9620.567074481525;9638.710838674851;9644.276679249224;9757.414555126716;8576.78558036029;8617.224449799549;9006.864897026418;9036.638534458549;9413.305604991167 11:57:57 INFO - PROCESS | 10181 | __end_tp_report 11:57:57 INFO - PROCESS | 10181 | __start_cc_report 11:57:57 INFO - PROCESS | 10181 | _x_x_mozilla_cycle_collect,805 11:57:57 INFO - PROCESS | 10181 | __end_cc_report 11:57:57 INFO - PROCESS | 10181 | __startTimestamp1456775877270__endTimestamp 11:57:57 INFO - PROCESS | 10181 | 11:57:57 INFO - PROCESS | 10181 | ------- Summary: start ------- 11:57:57 INFO - PROCESS | 10181 | Number of tests: 6 11:57:57 INFO - PROCESS | 10181 | 11:57:57 INFO - PROCESS | 10181 | [#0] dojo.html Cycles:165 Average:5040.04 Median:5215.84 stddev:539.10 (10.3%) stddev-sans-first:518.09 11:57:57 INFO - PROCESS | 10181 | Values: 3068.4 3104.7 3146.9 3150.6 3169.7 4925.9 4949.3 5011.7 5039.6 5052.3 5027.4 5037.6 5040.8 5066.8 5100.4 4542.0 4560.9 4602.3 4658.1 4674.9 4637.1 4666.3 4677.2 4679.6 4706.5 4562.3 4603.1 4671.5 4697.4 4731.3 4664.9 4677.2 4684.3 4694.5 4720.5 4636.2 4647.3 4652.1 4678.5 4703.2 4872.0 4886.9 4915.1 4984.2 4993.7 5376.1 5380.9 5385.2 5389.5 5390.0 5389.1 5398.9 5416.5 5464.2 5480.1 5090.0 5114.4 5120.5 5173.2 5178.2 5572.1 5591.2 5591.5 5596.0 5600.1 5248.4 5337.4 5377.2 5405.1 5414.3 5499.3 5502.4 5511.9 5521.1 5571.9 5437.7 5448.0 5460.5 5461.9 5465.2 5285.7 5375.9 5452.6 5489.7 5498.4 4151.8 4162.0 4170.2 4199.6 4208.9 3750.2 3770.2 3777.1 3802.8 3804.3 4996.8 5092.4 5131.8 5142.7 5185.5 5364.4 5382.3 5389.8 5399.1 5413.8 4954.3 5025.8 5056.8 5058.2 5147.4 4564.7 4603.2 4610.1 4643.8 4650.1 5579.3 5624.7 5626.7 5629.4 5681.7 5339.3 5353.9 5363.5 5365.8 5370.6 5649.5 5650.1 5653.7 5672.3 5694.0 5278.9 5280.5 5283.5 5283.6 5313.1 5251.5 5339.9 5354.8 5356.1 5390.0 5267.6 5272.7 5277.3 5277.8 5301.9 5215.7 5215.8 5217.0 5238.9 5264.7 5160.2 5161.8 5162.6 5166.8 5183.1 5278.2 5314.3 5315.5 5333.9 5364.7 5200.0 5218.9 5229.9 5265.1 5270.8 11:57:57 INFO - PROCESS | 10181 | 11:57:57 INFO - PROCESS | 10181 | [#1] ext.html Cycles:180 Average:43741.60 Median:17568.28 stddev:72833.36 (414.6%) stddev-sans-first:72965.29 11:57:57 INFO - PROCESS | 10181 | Values: 493.1 518.9 526.1 532.5 552.1 27879.2 35546.5 36116.8 36225.0 36294.8 38147.4 38867.8 38871.0 38905.6 38911.6 7197.3 8328.0 8572.4 8585.7 9947.0 9987.2 10169.0 10175.1 10184.0 10214.8 10147.0 10169.0 10241.0 10245.6 10250.9 10112.8 10185.6 10196.1 10201.2 10201.6 9973.7 10371.9 10375.0 10377.1 10389.2 39753.6 40373.8 40465.0 40567.8 40601.6 3160.3 3190.9 3210.9 3212.3 3317.0 29839.3 30326.4 30712.4 30714.1 30781.0 3369.6 3393.8 3398.6 3442.9 3531.1 263663.0 264887.7 265803.0 266192.0 266221.0 41424.8 59103.7 59418.0 59484.7 59494.4 40013.2 40218.4 40278.6 40367.4 40384.8 12662.2 12681.6 12687.0 12714.7 12730.9 10703.8 10736.2 10751.1 10752.4 10757.0 13994.9 14095.6 14096.7 14178.2 14216.9 5592.3 5624.2 5673.1 5686.8 5762.8 907.8 956.2 963.5 1054.8 1074.0 26660.2 27081.5 27157.2 27192.5 27391.6 845.6 1003.9 1015.5 1016.0 1040.1 12605.4 12816.9 12988.7 13059.9 13181.7 292867.0 294187.0 295781.0 297187.0 298028.0 51641.0 52300.2 52784.5 52881.7 53240.0 1265.8 1273.2 1295.9 1302.2 1429.6 25338.5 25732.6 26005.0 26031.9 26421.7 43487.0 43945.0 43985.3 44041.6 44079.6 269554.0 272568.0 275805.0 278753.0 279040.0 27472.1 30977.4 31590.5 31853.7 32551.0 37375.0 37628.2 38334.0 38391.6 38718.8 31945.7 32030.8 32309.0 32618.3 33007.2 32258.4 38046.8 41218.0 41983.0 42145.4 35528.1 35950.3 36285.8 36362.6 36386.8 32319.5 32696.7 32732.7 32741.0 32823.8 23727.9 23771.9 23792.8 23913.4 24133.3 11:57:57 INFO - PROCESS | 10181 | 11:57:57 INFO - PROCESS | 10181 | [#2] jquery.html Cycles:180 Average:24585.48 Median:420473.00 stddev:69817.49 (16.6%) stddev-sans-first:69989.64 11:57:57 INFO - PROCESS | 10181 | Values: 355.0 355.2 363.8 365.8 369.0 16600.0 16901.7 17603.6 17962.0 17990.9 10930.7 11227.9 11260.8 11277.0 16551.8 4847.8 4964.8 4987.1 4999.7 5003.3 4933.8 4994.9 5019.3 5043.9 5051.8 5012.6 5025.6 5027.9 5039.5 5096.8 5077.1 5259.7 5470.5 5474.8 5488.5 5241.0 5250.9 5252.5 5257.0 5265.2 13787.8 17518.5 21045.4 21070.4 21091.0 2056.7 2146.9 2150.3 2209.7 2358.2 9469.7 9632.6 9733.9 9847.8 10002.6 1712.3 1820.7 1843.8 1859.2 1864.7 46915.5 48977.8 61587.0 61627.4 63635.0 10195.7 10266.8 10365.5 10366.7 10367.4 13502.9 13668.2 13702.6 13707.9 13742.5 6525.6 6571.9 7572.2 7774.8 7792.3 7413.3 7453.6 7566.4 7577.1 7600.7 4474.9 4563.3 4568.1 4589.0 4624.6 1839.2 1857.6 1893.8 1899.9 1901.7 811.8 820.3 873.2 919.1 930.9 15360.5 15869.2 15934.8 16122.4 16194.9 910.3 947.8 970.4 1032.7 1037.6 9117.2 9232.6 9293.2 9316.0 9567.7 414221.0 419793.0 421153.0 430864.0 441524.0 72537.0 73783.6 75446.6 76506.0 77656.6 942.4 1012.3 1049.4 1051.0 1051.3 14177.2 14929.7 15062.8 15211.9 15492.1 33393.3 33413.8 33492.2 34142.8 34370.8 44912.8 47217.8 48594.0 48673.3 50369.2 7843.4 7938.0 8034.1 8061.1 8196.4 11188.8 12576.3 12637.9 12653.6 12837.1 10248.9 10465.3 10755.8 10817.1 11073.7 5157.3 9587.9 9626.0 10004.6 10598.9 10159.5 11199.8 11248.9 11436.9 11481.1 7319.0 7469.6 7693.9 7769.3 7982.7 10362.1 10723.9 10822.2 10898.6 11097.1 11:57:57 INFO - PROCESS | 10181 | 11:57:57 INFO - PROCESS | 10181 | [#3] mootools.html Cycles:180 Average:5262.96 Median:6323.03 stddev:2736.90 (43.3%) stddev-sans-first:2728.94 11:57:57 INFO - PROCESS | 10181 | Values: 1369.7 1497.0 1521.2 1683.7 1842.6 6794.7 7478.1 7642.5 7657.4 7676.3 7157.7 7395.3 7408.8 7415.3 7422.6 1937.9 2183.4 2210.4 2235.8 2243.9 2202.9 2227.5 2227.5 2228.7 2229.8 2165.4 2246.2 2255.2 2255.8 2257.2 2164.2 2204.5 2208.7 2228.0 2230.8 2172.3 2180.7 2192.6 2199.8 2223.7 7581.2 7615.4 7620.2 7635.2 7647.2 4494.8 4548.4 4576.0 4609.4 4620.9 2934.1 2978.8 3013.4 3019.2 3060.7 905.6 923.2 932.0 937.2 955.6 10329.3 10333.1 10360.1 10375.7 10421.7 3990.9 4094.1 4113.7 4156.4 4158.9 8778.2 8839.7 8854.9 8861.4 8880.0 4051.2 4622.5 4661.6 4676.4 4677.0 4075.9 4119.0 4137.1 4149.4 4177.2 3499.8 3553.5 3557.1 3589.0 3598.9 1073.3 1077.6 1084.1 1084.6 1096.8 1329.6 1339.5 1368.7 1371.1 1387.5 7191.6 7373.4 7385.9 7386.0 7392.4 477.0 490.5 491.8 492.8 502.1 5659.3 5695.6 5701.4 5745.9 5751.5 8474.9 9014.0 9078.1 9083.0 9119.8 8879.5 8994.7 9012.3 9028.4 9049.3 6911.9 6967.4 6998.5 7009.2 7126.4 6722.7 6751.9 6772.1 6787.8 6792.7 7867.8 8085.4 8086.5 8168.3 8216.2 8113.4 8296.3 8424.6 8431.1 8432.9 6339.9 6432.7 6595.9 6671.3 6674.4 7145.1 7172.2 7182.6 7198.5 7251.8 6503.4 6676.6 6704.2 6778.3 6804.5 6507.2 6573.6 6588.8 6637.0 6679.9 6514.4 6605.7 6610.2 6652.8 6677.8 6306.1 6366.9 6369.3 6393.2 6416.4 6219.6 6233.3 6273.0 6274.2 6276.1 11:57:57 INFO - PROCESS | 10181 | 11:57:57 INFO - PROCESS | 10181 | [#4] prototype.html Cycles:180 Average:5198.40 Median:5890.66 stddev:1588.61 (27.0%) stddev-sans-first:1550.32 11:57:57 INFO - PROCESS | 10181 | Values: 321.6 327.2 328.6 334.2 334.8 5837.5 5872.3 5886.4 5900.7 5901.1 5798.5 5800.2 5802.3 5805.7 5816.3 4311.0 4459.2 4520.3 4558.4 4588.5 4545.5 4565.3 4568.1 4568.1 4573.2 4451.3 4504.4 4504.7 4514.1 4536.2 4282.9 4356.4 4443.9 4471.4 4471.7 3915.7 3920.6 3930.9 3934.5 3949.3 5550.5 5553.7 5572.6 5572.8 5574.0 5188.5 5189.8 5189.9 5192.3 5195.1 6091.4 6119.2 6120.8 6130.7 6150.0 4088.8 4188.4 4191.0 4349.1 4378.5 6354.3 6423.5 6443.9 6446.1 6456.5 4326.2 4357.4 4369.5 4375.9 4378.5 4416.8 4423.2 4423.3 4425.2 4425.5 5091.5 5103.2 5134.7 5136.0 5145.8 6011.0 6229.3 6235.7 6242.6 6253.9 1523.6 1534.0 1534.8 1537.4 1537.9 930.3 1004.3 1015.8 1029.2 1048.4 5838.7 5888.7 5890.6 5895.6 5901.6 6309.8 6310.4 6312.2 6321.4 6327.2 5877.5 5890.7 5893.7 5893.9 5908.6 3384.1 3401.7 3406.8 3410.6 3414.0 6569.6 6618.1 6653.6 6793.8 6817.5 6596.7 6610.4 6619.6 6633.1 6652.2 6762.4 6766.4 6793.0 6800.2 6823.2 6438.0 6457.5 6463.1 6471.4 6485.3 6219.0 6404.3 6416.2 6418.0 6423.0 6790.1 6807.5 6810.2 6816.2 6826.1 4279.7 4286.8 4288.4 4294.6 4300.5 6458.0 6461.2 6465.5 6468.3 6473.7 6265.3 6269.6 6277.2 6287.1 6293.2 6082.5 6243.6 6269.0 6298.4 6307.2 6137.2 6155.1 6170.0 6170.6 6177.3 6288.4 6294.2 6296.5 6300.9 6301.7 5945.7 6001.8 6146.4 6147.2 6150.2 11:57:57 INFO - PROCESS | 10181 | 11:57:57 INFO - PROCESS | 10181 | [#5] yui.html Cycles:180 Average:13398.52 Median:24550.13 stddev:15105.63 (61.5%) stddev-sans-first:15117.89 11:57:57 INFO - PROCESS | 10181 | Values: 696.6 756.4 802.8 820.9 845.3 13800.9 13962.1 13966.7 13979.5 14016.4 13055.5 13075.1 13093.3 13094.1 14445.0 831.5 844.3 849.7 850.7 850.9 828.7 838.7 838.9 839.0 839.2 896.6 898.8 899.7 899.9 900.5 891.9 899.6 900.0 900.4 901.0 659.7 663.0 663.3 663.7 664.5 13743.9 13764.4 13766.4 13767.5 13783.2 12511.9 12668.4 12784.1 12910.9 13016.8 10422.8 10449.7 10644.4 10744.8 11191.4 3627.1 3647.4 3670.2 3774.8 3781.8 47597.8 47681.8 47686.5 47701.5 47723.8 9647.8 10001.6 10123.2 10176.7 10522.6 18885.5 18896.1 18914.2 18924.0 18973.3 7369.4 7406.3 7511.2 7636.4 7738.7 4172.6 4296.8 4348.7 4421.7 4624.7 3000.5 3004.3 3021.3 3023.2 3027.2 525.1 541.0 541.3 542.7 543.7 495.7 543.8 566.6 655.1 661.4 7763.5 7999.6 8070.5 8149.1 8209.4 619.9 629.0 643.5 656.6 657.2 3667.7 3796.8 3806.2 3825.8 3850.5 53694.7 53859.7 54703.0 54718.7 54906.7 47094.8 47631.0 48059.8 48585.5 49218.5 39003.4 42876.4 43707.0 44678.6 46348.8 7931.4 8110.6 8132.7 8170.5 8313.2 32357.5 33470.8 33666.7 34266.1 34301.7 39341.8 39399.4 42240.6 42361.6 43171.4 10870.8 11230.6 11283.9 11503.3 11582.4 11845.1 11940.7 12298.4 12384.8 12490.4 10832.8 11071.4 11149.6 11185.9 11329.3 11220.3 11599.1 11657.5 11867.5 11938.6 10070.0 10304.5 10452.8 10456.7 10462.9 9252.8 9620.6 9638.7 9644.3 9757.4 8576.8 8617.2 9006.9 9036.6 9413.3 11:57:57 INFO - PROCESS | 10181 | -------- Summary: end -------- 11:57:57 INFO - PROCESS | 10181 | 11:57:57 INFO - PROCESS | 10181 | nsHttpConnectionMgr::Shutdown() ProcessNextEvent 11:57:57 INFO - PROCESS | 10181 | nsHttpConnectionMgr::Shutdown() ProcessNextEvent 11:57:57 INFO - PROCESS | 10181 | nsHttpConnectionMgr::Shutdown() ProcessNextEvent 11:57:57 INFO - PROCESS | 10181 | nsHttpConnectionMgr::Shutdown() ProcessNextEvent 11:57:57 INFO - PROCESS | 10181 | nsHttpConnectionMgr::Shutdown() ProcessNextEvent 11:57:58 INFO - TEST-INFO | 10181: exit 0 11:57:58 INFO - TEST-OK | dromaeo_css | took 1112248ms 11:57:58 INFO - TEST-START | kraken 11:57:58 INFO - operating with platform_type : linux_ 11:57:58 INFO - Initialising browser for kraken test... 11:57:58 INFO - TEST-INFO | started process 10370 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpWCz5Ay/profile http://localhost:50410/getInfo.html) 11:58:01 INFO - PROCESS | 10370 | __metrics Screen width/height:1600/1200 11:58:01 INFO - PROCESS | 10370 | colorDepth:24 11:58:01 INFO - PROCESS | 10370 | Browser inner width/height: 1024/697 11:58:01 INFO - PROCESS | 10370 | __metrics 11:58:02 INFO - PROCESS | 10370 | JavaScript error: resource://app/modules/WebappManager.jsm, line 48: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 11:58:02 INFO - PROCESS | 10370 | nsHttpConnectionMgr::Shutdown() ProcessNextEvent 11:58:02 INFO - PROCESS | 10370 | nsHttpConnectionMgr::Shutdown() ProcessNextEvent 11:58:02 INFO - PROCESS | 10370 | nsHttpConnectionMgr::Shutdown() ProcessNextEvent 11:58:02 INFO - PROCESS | 10370 | nsHttpConnectionMgr::Shutdown() ProcessNextEvent 11:58:02 INFO - PROCESS | 10370 | nsHttpConnectionMgr::Shutdown() ProcessNextEvent 11:58:02 INFO - PROCESS | 10370 | nsHttpConnectionMgr::Shutdown() ProcessNextEvent 11:58:02 INFO - PROCESS | 10370 | nsHttpConnectionMgr::Shutdown() ProcessNextEvent 11:58:03 INFO - TEST-INFO | 10370: exit 0 11:58:03 INFO - Browser initialized. 11:58:03 INFO - Running cycle 1/1 for kraken test... 11:58:03 INFO - TEST-INFO | started process 10454 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpWCz5Ay/profile -tp file:/builds/slave/test-pgo/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 11:58:14 INFO - PROCESS | 10454 | RSS: Main: 152768512 11:58:14 INFO - PROCESS | 10454 | 11:58:17 INFO - PROCESS | 10454 | Cycle 1(1): loaded http://localhost:50410/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:50410/tests/kraken/driver.html?testName=audio-beat-detection) 11:58:18 INFO - PROCESS | 10454 | RSS: Main: 198877184 11:58:18 INFO - PROCESS | 10454 | 11:58:20 INFO - PROCESS | 10454 | Cycle 1(1): loaded http://localhost:50410/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:50410/tests/kraken/driver.html?testName=audio-dft) 11:58:21 INFO - PROCESS | 10454 | RSS: Main: 186785792 11:58:21 INFO - PROCESS | 10454 | 11:58:24 INFO - PROCESS | 10454 | Cycle 1(1): loaded http://localhost:50410/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:50410/tests/kraken/driver.html?testName=audio-fft) 11:58:24 INFO - PROCESS | 10454 | RSS: Main: 171089920 11:58:24 INFO - PROCESS | 10454 | 11:58:26 INFO - PROCESS | 10454 | Cycle 1(1): loaded http://localhost:50410/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:50410/tests/kraken/driver.html?testName=audio-oscillator) 11:58:27 INFO - PROCESS | 10454 | RSS: Main: 174268416 11:58:27 INFO - PROCESS | 10454 | 11:58:29 INFO - PROCESS | 10454 | Cycle 1(1): loaded http://localhost:50410/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:50410/tests/kraken/driver.html?testName=imaging-gaussian-blur) 11:58:30 INFO - PROCESS | 10454 | RSS: Main: 174600192 11:58:30 INFO - PROCESS | 10454 | 11:58:33 INFO - PROCESS | 10454 | Cycle 1(1): loaded http://localhost:50410/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:50410/tests/kraken/driver.html?testName=imaging-darkroom) 11:58:33 INFO - PROCESS | 10454 | RSS: Main: 176050176 11:58:33 INFO - PROCESS | 10454 | 11:58:37 INFO - PROCESS | 10454 | Cycle 1(1): loaded http://localhost:50410/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:50410/tests/kraken/driver.html?testName=imaging-desaturate) 11:58:37 INFO - PROCESS | 10454 | RSS: Main: 176799744 11:58:37 INFO - PROCESS | 10454 | 11:58:40 INFO - PROCESS | 10454 | Cycle 1(1): loaded http://localhost:50410/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:50410/tests/kraken/driver.html?testName=json-parse-financial) 11:58:41 INFO - PROCESS | 10454 | RSS: Main: 176537600 11:58:41 INFO - PROCESS | 10454 | 11:58:42 INFO - PROCESS | 10454 | Cycle 1(1): loaded http://localhost:50410/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:50410/tests/kraken/driver.html?testName=json-stringify-tinderbox) 11:58:43 INFO - PROCESS | 10454 | RSS: Main: 188317696 11:58:43 INFO - PROCESS | 10454 | 11:58:45 INFO - PROCESS | 10454 | Cycle 1(1): loaded http://localhost:50410/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:50410/tests/kraken/driver.html?testName=stanford-crypto-aes) 11:58:45 INFO - PROCESS | 10454 | RSS: Main: 188600320 11:58:45 INFO - PROCESS | 10454 | 11:58:47 INFO - PROCESS | 10454 | Cycle 1(1): loaded http://localhost:50410/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:50410/tests/kraken/driver.html?testName=stanford-crypto-ccm) 11:58:48 INFO - PROCESS | 10454 | RSS: Main: 196833280 11:58:48 INFO - PROCESS | 10454 | 11:58:50 INFO - PROCESS | 10454 | Cycle 1(1): loaded http://localhost:50410/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:50410/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 11:58:51 INFO - PROCESS | 10454 | RSS: Main: 201977856 11:58:51 INFO - PROCESS | 10454 | 11:58:54 INFO - PROCESS | 10454 | Cycle 1(1): loaded http://localhost:50410/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:50410/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 11:58:54 INFO - PROCESS | 10454 | RSS: Main: 201211904 11:58:54 INFO - PROCESS | 10454 | 11:58:56 INFO - PROCESS | 10454 | Cycle 1(1): loaded http://localhost:50410/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:50410/tests/kraken/driver.html?testName=ai-astar) 11:58:56 INFO - PROCESS | 10454 | RSS: Main: 260300800 11:58:56 INFO - PROCESS | 10454 | 11:58:56 INFO - PROCESS | 10454 | __start_tp_report 11:58:56 INFO - PROCESS | 10454 | _x_x_mozilla_page_load 11:58:56 INFO - PROCESS | 10454 | _x_x_mozilla_page_load_details 11:58:56 INFO - PROCESS | 10454 | |i|pagename|runs| 11:58:56 INFO - PROCESS | 10454 | |0;ai-astar;113;114;108;115;112;112;103;111;112;113 11:58:56 INFO - PROCESS | 10454 | |1;audio-beat-detection;152;134;162;168;133;160;153;132;166;126 11:58:56 INFO - PROCESS | 10454 | |2;audio-dft;162;166;163;164;165;161;164;164;164;164 11:58:56 INFO - PROCESS | 10454 | |3;audio-fft;75;74;109;95;75;74;73;109;94;72 11:58:56 INFO - PROCESS | 10454 | |4;audio-oscillator;98;98;143;97;97;98;154;97;97;136 11:58:56 INFO - PROCESS | 10454 | |5;imaging-gaussian-blur;119;115;115;115;115;114;116;115;115;115 11:58:56 INFO - PROCESS | 10454 | |6;imaging-darkroom;147;146;148;146;147;146;147;146;146;147 11:58:56 INFO - PROCESS | 10454 | |7;imaging-desaturate;96;96;96;96;96;96;97;96;96;96 11:58:56 INFO - PROCESS | 10454 | |8;json-parse-financial;58;57;57;56;58;56;59;70;54;53 11:58:56 INFO - PROCESS | 10454 | |9;json-stringify-tinderbox;68;68;68;68;69;67;68;69;69;68 11:58:56 INFO - PROCESS | 10454 | |10;stanford-crypto-aes;83;91;84;85;86;83;83;94;84;84 11:58:56 INFO - PROCESS | 10454 | |11;stanford-crypto-ccm;122;118;119;127;126;122;120;132;122;122 11:58:56 INFO - PROCESS | 10454 | |12;stanford-crypto-pbkdf2;148;144;155;155;153;143;158;162;154;144 11:58:56 INFO - PROCESS | 10454 | |13;stanford-crypto-sha256-iterative;71;72;71;70;71;72;69;74;72;69 11:58:56 INFO - PROCESS | 10454 | __end_tp_report 11:58:56 INFO - PROCESS | 10454 | __start_cc_report 11:58:56 INFO - PROCESS | 10454 | _x_x_mozilla_cycle_collect,1087 11:58:56 INFO - PROCESS | 10454 | __end_cc_report 11:58:56 INFO - PROCESS | 10454 | __startTimestamp1456775936629__endTimestamp 11:58:56 INFO - PROCESS | 10454 | 11:58:56 INFO - PROCESS | 10454 | ------- Summary: start ------- 11:58:56 INFO - PROCESS | 10454 | Number of tests: 14 11:58:56 INFO - PROCESS | 10454 | 11:58:56 INFO - PROCESS | 10454 | [#0] ai-astar Cycles:10 Average:111.30 Median:112.50 stddev:3.47 (3.1%) stddev-sans-first:3.62 11:58:56 INFO - PROCESS | 10454 | Values: 113.0 114.0 108.0 115.0 112.0 112.0 103.0 111.0 112.0 113.0 11:58:56 INFO - PROCESS | 10454 | 11:58:56 INFO - PROCESS | 10454 | [#1] audio-beat-detection Cycles:10 Average:148.60 Median:156.50 stddev:15.85 (10.1%) stddev-sans-first:16.77 11:58:56 INFO - PROCESS | 10454 | Values: 152.0 134.0 162.0 168.0 133.0 160.0 153.0 132.0 166.0 126.0 11:58:56 INFO - PROCESS | 10454 | 11:58:56 INFO - PROCESS | 10454 | [#2] audio-dft Cycles:10 Average:163.70 Median:164.00 stddev:1.42 (0.9%) stddev-sans-first:1.36 11:58:56 INFO - PROCESS | 10454 | Values: 162.0 166.0 163.0 164.0 165.0 161.0 164.0 164.0 164.0 164.0 11:58:56 INFO - PROCESS | 10454 | 11:58:56 INFO - PROCESS | 10454 | [#3] audio-fft Cycles:10 Average:85.00 Median:74.50 stddev:15.23 (20.4%) stddev-sans-first:15.72 11:58:56 INFO - PROCESS | 10454 | Values: 75.0 74.0 109.0 95.0 75.0 74.0 73.0 109.0 94.0 72.0 11:58:56 INFO - PROCESS | 10454 | 11:58:56 INFO - PROCESS | 10454 | [#4] audio-oscillator Cycles:10 Average:111.50 Median:97.00 stddev:23.06 (23.8%) stddev-sans-first:23.94 11:58:56 INFO - PROCESS | 10454 | Values: 98.0 98.0 143.0 97.0 97.0 98.0 154.0 97.0 97.0 136.0 11:58:56 INFO - PROCESS | 10454 | 11:58:56 INFO - PROCESS | 10454 | [#5] imaging-gaussian-blur Cycles:10 Average:115.40 Median:115.00 stddev:1.35 (1.2%) stddev-sans-first:0.50 11:58:56 INFO - PROCESS | 10454 | Values: 119.0 115.0 115.0 115.0 115.0 114.0 116.0 115.0 115.0 115.0 11:58:56 INFO - PROCESS | 10454 | 11:58:56 INFO - PROCESS | 10454 | [#6] imaging-darkroom Cycles:10 Average:146.60 Median:147.00 stddev:0.70 (0.5%) stddev-sans-first:0.73 11:58:56 INFO - PROCESS | 10454 | Values: 147.0 146.0 148.0 146.0 147.0 146.0 147.0 146.0 146.0 147.0 11:58:56 INFO - PROCESS | 10454 | 11:58:56 INFO - PROCESS | 10454 | [#7] imaging-desaturate Cycles:10 Average:96.10 Median:96.00 stddev:0.32 (0.3%) stddev-sans-first:0.33 11:58:56 INFO - PROCESS | 10454 | Values: 96.0 96.0 96.0 96.0 96.0 96.0 97.0 96.0 96.0 96.0 11:58:56 INFO - PROCESS | 10454 | 11:58:56 INFO - PROCESS | 10454 | [#8] json-parse-financial Cycles:10 Average:57.80 Median:57.50 stddev:4.66 (8.1%) stddev-sans-first:4.94 11:58:56 INFO - PROCESS | 10454 | Values: 58.0 57.0 57.0 56.0 58.0 56.0 59.0 70.0 54.0 53.0 11:58:56 INFO - PROCESS | 10454 | 11:58:56 INFO - PROCESS | 10454 | [#9] json-stringify-tinderbox Cycles:10 Average:68.20 Median:68.00 stddev:0.63 (0.9%) stddev-sans-first:0.67 11:58:56 INFO - PROCESS | 10454 | Values: 68.0 68.0 68.0 68.0 69.0 67.0 68.0 69.0 69.0 68.0 11:58:56 INFO - PROCESS | 10454 | 11:58:56 INFO - PROCESS | 10454 | [#10] stanford-crypto-aes Cycles:10 Average:85.70 Median:84.50 stddev:3.77 (4.5%) stddev-sans-first:3.87 11:58:56 INFO - PROCESS | 10454 | Values: 83.0 91.0 84.0 85.0 86.0 83.0 83.0 94.0 84.0 84.0 11:58:56 INFO - PROCESS | 10454 | 11:58:56 INFO - PROCESS | 10454 | [#11] stanford-crypto-ccm Cycles:10 Average:123.00 Median:122.00 stddev:4.22 (3.5%) stddev-sans-first:4.46 11:58:56 INFO - PROCESS | 10454 | Values: 122.0 118.0 119.0 127.0 126.0 122.0 120.0 132.0 122.0 122.0 11:58:56 INFO - PROCESS | 10454 | 11:58:56 INFO - PROCESS | 10454 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:151.60 Median:154.50 stddev:6.52 (4.2%) stddev-sans-first:6.78 11:58:56 INFO - PROCESS | 10454 | Values: 148.0 144.0 155.0 155.0 153.0 143.0 158.0 162.0 154.0 144.0 11:58:56 INFO - PROCESS | 10454 | 11:58:56 INFO - PROCESS | 10454 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:71.10 Median:71.50 stddev:1.52 (2.1%) stddev-sans-first:1.62 11:58:56 INFO - PROCESS | 10454 | Values: 71.0 72.0 71.0 70.0 71.0 72.0 69.0 74.0 72.0 69.0 11:58:56 INFO - PROCESS | 10454 | -------- Summary: end -------- 11:58:56 INFO - PROCESS | 10454 | 11:58:56 INFO - PROCESS | 10454 | nsHttpConnectionMgr::Shutdown() ProcessNextEvent 11:58:56 INFO - PROCESS | 10454 | nsHttpConnectionMgr::Shutdown() ProcessNextEvent 11:58:56 INFO - PROCESS | 10454 | nsHttpConnectionMgr::Shutdown() ProcessNextEvent 11:58:56 INFO - PROCESS | 10454 | nsHttpConnectionMgr::Shutdown() ProcessNextEvent 11:58:56 INFO - PROCESS | 10454 | nsHttpConnectionMgr::Shutdown() ProcessNextEvent 11:58:56 INFO - PROCESS | 10454 | nsHttpConnectionMgr::Shutdown() ProcessNextEvent 11:58:56 INFO - PROCESS | 10454 | nsHttpConnectionMgr::Shutdown() ProcessNextEvent 11:58:57 INFO - TEST-INFO | 10454: exit 0 11:58:57 INFO - TEST-OK | kraken | took 59471ms 11:58:57 INFO - SUITE-END | took 1171s 11:58:57 INFO - Completed test suite (00:19:31) 11:58:57 INFO - Working with test: dromaeo_css 11:58:57 INFO - Generating results file: dromaeo_css 11:58:57 INFO - Working with test: kraken 11:58:57 INFO - Generating results file: kraken 11:58:57 INFO - javascript benchmark 11:58:57 INFO - Posting result 0 of 2 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 11:58:57 INFO - process_Request line: dromaeo_css graph.html#tests=[[72,64,35]] 11:58:57 INFO - process_Request line: dromaeo_css 6680.15 graph.html#tests=[[72,64,35]] 11:58:57 INFO - Posting result 1 of 2 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 11:58:57 INFO - process_Request line: kraken 1535.60 graph.html#tests=[[232,64,35]] 11:58:57 INFO - RETURN: dromaeo_css: 6680.15 11:58:57 INFO - RETURN: kraken: 1535.60 11:58:57 INFO - javascript benchmark 11:58:57 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"lowerIsBetter": false, "subtests": [{"lowerIsBetter": false, "replicates": [3068.401661675973, 3104.689531046894, 3146.9213269668257, 3150.6061742282213, 3169.6988786065317, 4925.901481970367, 4949.257611358298, 5011.724355160465, 5039.571636410905, 5052.343195384595, 5027.4469808321055, 5037.647364684473, 5040.790210349517, 5066.822661206858, 5100.362454693163, 4541.954580454186, 4560.931586026212, 4602.263637817933, 4658.091672123937, 4674.90650186996, 4637.095766325551, 4666.346711460398, 4677.204875171229, 4679.625629949596, 4706.458757242909, 4562.270036794131, 4603.10239503297, 4671.532846715319, 4697.436307643071, 4731.290306454025, 4664.86005419838, 4677.204875171229, 4684.273937539687, 4694.530546945278, 4720.480747117815, 4636.165490211761, 4647.302904564309, 4652.139354219446, 4678.485366609671, 4703.2239680452685, 4871.951280487186, 4886.926696099561, 4915.115279249733, 4984.22744474607, 4993.650444468889, 5376.1398176292, 5380.91928621071, 5385.192221166856, 5389.541888939445, 5390.0, 5389.056915039852, 5398.946010539884, 5416.458354164592, 5464.207689884945, 5480.068388373986, 5090.0, 5114.360704911923, 5120.513551212629, 5173.198154286091, 5178.171492561172, 5572.136318870582, 5591.161325801162, 5591.4688104629995, 5596.048671725816, 5600.075987462104, 5248.370195576479, 5337.359516857924, 5377.193420986883, 5405.081136206854, 5414.296141501658, 5499.312585926759, 5502.367227768857, 5511.889762204733, 5521.1442226454965, 5571.860703482445, 5437.673739575638, 5448.046591846411, 5460.481254280837, 5461.918071228855, 5465.180222966507, 5285.709285989307, 5375.865603359869, 5452.645578037414, 5489.737360407049, 5498.367687715964, 4151.750894946313, 4161.97919010403, 4170.207660544487, 4199.622034016953, 4208.894777630522, 3750.1937083526627, 3770.170562476251, 3777.0746167189213, 3802.8478860845257, 3804.2962052020466, 4996.7501624918605, 5092.414372347153, 5131.794728210904, 5142.665726727751, 5185.455527169668, 5364.409914909357, 5382.273393091961, 5389.83830485086, 5399.055165346049, 5413.783448662089, 4954.256861470736, 5025.84922452327, 5056.772445239973, 5058.215976523645, 5147.40804807452, 4564.657650676212, 4603.194440972817, 4610.10103029906, 4643.814247430065, 4650.139724151043, 5579.302587176603, 5624.695337292669, 5626.662400255997, 5629.352624448159, 5681.687507187145, 5339.3058902342445, 5353.946460535345, 5363.463653634605, 5365.785368585213, 5370.624056316176, 5649.4633009864, 5650.0959846424375, 5653.745581448762, 5672.262605861211, 5694.032014557618, 5278.920816187837, 5280.471952804689, 5283.498067683564, 5283.577313814809, 5313.123334649739, 5251.5011073949445, 5339.866503337447, 5354.812581559627, 5356.143017117242, 5389.973050134724, 5267.604929630216, 5272.736363181749, 5277.261183434245, 5277.815276465305, 5301.893962120659, 5215.687058776485, 5215.843524694265, 5217.0, 5238.895222095461, 5264.736763161904, 5160.200168973815, 5161.7677204526635, 5162.586993040472, 5166.844994650167, 5183.11886979222, 5278.155495120763, 5314.256004159498, 5315.548178404879, 5333.893322133613, 5364.678119312697, 5199.986002729432, 5218.947810521846, 5229.921551176812, 5265.131253343308, 5270.841874743764], "unit": "score", "name": "dojo.html", "value": 5006.716117055182}, {"lowerIsBetter": false, "replicates": [493.117319997205, 518.885845114075, 526.1397614899643, 532.4701921588021, 552.1469329885329, 27879.163625091256, 35546.466802997944, 36116.81941590295, 36225.0, 36294.8185259074, 38147.427788583125, 38867.805660971724, 38871.0, 38905.610943890555, 38911.61088389115, 7197.316254955797, 8327.958360208191, 8572.399932004762, 8585.742427727178, 9947.0, 9987.201023918069, 10169.0, 10175.084242418181, 10184.0, 10214.846777298346, 10147.0, 10169.0, 10241.0, 10245.590176392972, 10250.948745256263, 10112.797744045114, 10185.643502477415, 10196.082352588302, 10201.234907381902, 10201.591936322538, 9973.700788976343, 10371.948140259326, 10375.0, 10377.117944974687, 10389.168866490663, 39753.60246397528, 40373.79813100945, 40465.0, 40567.79716101401, 40601.59398406008, 3160.336329370835, 3190.88831890885, 3210.8611126284372, 3212.27723762154, 3316.9834150829092, 29839.25401864949, 30326.393472130654, 30712.38575228483, 30714.078577642482, 30781.0, 3369.629340772513, 3393.7624366294367, 3398.5581874356176, 3442.915481623306, 3531.0819187011307, 263663.0, 264887.6755616229, 265803.0, 266192.0, 266221.0, 41424.792876035426, 59103.68066874002, 59418.0, 59484.7025764877, 59494.405055949755, 40013.1990760644, 40218.39672404916, 40278.59721402807, 40367.39448908269, 40384.79807600943, 12662.176958497668, 12681.619551413472, 12687.0, 12714.745705086032, 12730.872691272969, 10703.83944240837, 10736.248462607698, 10751.08615767653, 10752.354858708502, 10757.031867131996, 13994.930025349808, 14095.577132686036, 14096.731294183573, 14178.220197889008, 14216.928915355564, 5592.328920529562, 5624.240727501817, 5673.063944449203, 5686.800961966312, 5762.827115186551, 907.7594437474074, 956.2111258211864, 963.5134257200069, 1054.7626783973544, 1073.9516721747384, 26660.200193994213, 27081.45837083247, 27157.185284441497, 27192.45615087687, 27391.589126163122, 845.556083056388, 1003.859459675646, 1015.4719545836124, 1015.97460063499, 1040.095117247999, 12605.369731513387, 12816.871831281755, 12988.675283117998, 13059.934700326437, 13181.670458238428, 292867.0, 294187.0, 295781.0, 297187.0, 298028.0, 51641.0, 52300.21549676758, 52784.47215527796, 52881.7355913218, 53240.0, 1265.8354413926131, 1273.1915233826587, 1295.9481620735064, 1302.1991475242846, 1429.6068581140269, 25338.493230134925, 25732.61401079023, 26005.0, 26031.869840650674, 26421.73578264193, 43487.0, 43945.0, 43985.34021989737, 44041.559584403745, 44079.559204407546, 269554.0, 272568.0, 275805.0, 278753.0, 279040.0, 27472.076954612985, 30977.380452390375, 31590.52614210743, 31853.681463185072, 32551.0, 37375.0, 37628.24743505169, 38334.0, 38391.6160838388, 38718.80640596779, 31945.68054319427, 32030.839845800623, 32309.0, 32618.34763304673, 33007.174820629676, 32258.35483290368, 38046.809765950995, 41218.0, 41983.0, 42145.36781948212, 35528.111797205274, 35950.28099437944, 36285.818570908035, 36362.63637363593, 36386.81806591056, 32319.51520727144, 32696.673033270315, 32732.672673272962, 32741.0, 32823.83406861645, 23727.881360593088, 23771.881140594185, 23792.762072379748, 23913.40216494532, 24133.276001719976], "unit": "score", "name": "ext.html", "value": 17467.758787262064}, {"lowerIsBetter": false, "replicates": [354.9882833923317, 355.2486491071384, 363.83991043940665, 365.8042947023343, 368.98893033209015, 16600.0, 16901.661966760657, 17603.559911002216, 17962.0, 17990.910045449753, 10930.672079837597, 11227.887721122786, 11260.774784504305, 11276.985071343577, 16551.751723724123, 4847.781849816767, 4964.776585053682, 4987.127252730776, 4999.675021123633, 5003.349564556603, 4933.777979990909, 4994.900101997958, 5019.272205530196, 5043.924341134886, 5051.772670229849, 5012.573931215833, 5025.648204625678, 5027.949720502803, 5039.546440820325, 5096.847094587169, 5077.111505486543, 5259.737013149346, 5470.452954704538, 5474.768177160147, 5488.506034456878, 5241.0, 5250.921236181461, 5252.527272545489, 5257.0, 5265.183896496049, 13787.793183102262, 17518.474445766646, 21045.369328833895, 21070.367888963356, 21091.0, 2056.7120603115577, 2146.8604540704805, 2150.2796563151364, 2209.668549717539, 2358.2099996501192, 9469.715908522756, 9632.566534505893, 9733.90266097337, 9847.753806154831, 10002.59989600415, 1712.2808420463311, 1820.6722789897813, 1843.8432733217692, 1859.2191279662575, 1864.7482589850333, 46915.53084469146, 48977.75511122457, 61587.0, 61627.38372616261, 63635.0, 10195.694129176136, 10266.819315778781, 10365.533550990072, 10366.688999330032, 10367.429791361397, 13502.91976641886, 13668.248246346546, 13702.588922332347, 13707.862921370857, 13742.450301988009, 6525.608463492111, 6571.934280657132, 7572.167061623217, 7774.766756997299, 7792.259735325135, 7413.332800048021, 7453.627318634047, 7566.432517561095, 7577.052868391451, 7600.657970391346, 4474.910501789946, 4563.338315944169, 4568.086382723469, 4588.95411045892, 4624.560666736655, 1839.202047771348, 1857.5634725839418, 1893.848492120627, 1899.905004749757, 1901.7242499837446, 811.7808191788184, 820.2658620534708, 873.1752779757479, 919.1451949686856, 930.9255259579218, 15360.539183824503, 15869.20653967297, 15934.840651593568, 16122.435714749927, 16194.919025405034, 910.3218102513538, 947.7820101376584, 970.427447805798, 1032.7056788815303, 1037.600523798328, 9117.225035871892, 9232.584533696, 9293.210077143518, 9316.043630837465, 9567.712968610953, 414221.0, 419793.0, 421153.0, 430864.0, 441524.0, 72537.0, 73783.63108184424, 75446.62276688582, 76506.0, 77656.61171694106, 942.3921570586933, 1012.291396022787, 1049.3861091261697, 1050.9527071281964, 1051.264115119404, 14177.23543908969, 14929.701405972037, 15062.849371506583, 15211.92394038067, 15492.147931863856, 33393.33213335768, 33413.832930836164, 33492.1626959328, 34142.82928585341, 34370.82814585911, 44912.77543612261, 47217.76391118023, 48594.0, 48673.26990095081, 50369.244461332375, 7843.4117441191, 7938.0, 8034.116247212685, 8061.072976607765, 8196.42625016243, 11188.83216751733, 12576.30830304342, 12637.87362126367, 12653.620391388273, 12837.101402901708, 10248.897511024794, 10465.319754215952, 10755.784884302426, 10817.080548153495, 11073.667789966314, 5157.303763991813, 9587.856182157133, 9625.989271126711, 10004.599816007278, 10598.947005264925, 10159.542820572944, 11199.832002520132, 11248.88751112511, 11436.885631143583, 11481.138914581607, 7318.96340518294, 7469.626518674153, 7693.88459173124, 7769.339606133542, 7982.680692772224, 10362.119219866396, 10723.94638026836, 10822.188335874998, 10898.618548350769, 11097.112231021338], "unit": "score", "name": "jquery.html", "value": 8155.791048311314}, {"lowerIsBetter": false, "replicates": [1369.650739061539, 1496.970060598788, 1521.163360151916, 1683.730603103503, 1842.5577861313288, 6794.66026698665, 7478.102627684679, 7642.465027448081, 7657.425693073021, 7676.347510461604, 7157.713691452335, 7395.260473952616, 7408.777736667895, 7415.295546923047, 7422.554646721201, 1937.8740381875205, 2183.410479170623, 2210.403191138396, 2235.765244649313, 2243.9439014024615, 2202.933911982635, 2227.4988127671227, 2227.498812767131, 2228.687983682286, 2229.7547269800307, 2165.436986383536, 2246.2475070851283, 2255.188132272389, 2255.796978271955, 2257.1761307122947, 2164.2208804830248, 2204.526026904215, 2208.7349518057777, 2227.9665805012937, 2230.828814872189, 2172.283146561631, 2180.738311402626, 2192.572448372568, 2199.7580266170708, 2223.6664500325082, 7581.203973582805, 7615.390768738543, 7620.161782203953, 7635.160132385433, 7647.235276472364, 4494.8202071917085, 4548.363229147922, 4575.977120114411, 4609.423822022247, 4620.907581848344, 2934.1344303430537, 2978.8361640109783, 3013.382256637384, 3019.1697283247063, 3060.6786287439945, 905.5970093308415, 923.1599244687302, 931.9813603727888, 937.1565590968115, 955.6320816485634, 10329.276950613461, 10333.121684656813, 10360.119389851796, 10375.740606484822, 10421.739456513573, 3990.920181596352, 4094.058366575645, 4113.691473139466, 4156.397322388237, 4158.9376159357025, 8778.209961103532, 8839.734807955772, 8854.86717699235, 8861.424007439497, 8879.955600222087, 4051.230266249403, 4622.514635963243, 4661.557152070548, 4676.368690226844, 4677.041206552649, 4075.898102547401, 4119.0, 4137.131202447459, 4149.356849688304, 4177.164567086595, 3499.807510586942, 3553.502509648651, 3557.1107223194203, 3589.0, 3598.9100272493397, 1073.259450978822, 1077.6066735641434, 1084.1001968366238, 1084.6366467233408, 1096.786126705285, 1329.6144118205805, 1339.5445548513358, 1368.6783605852618, 1371.1156304183746, 1387.5421111033336, 7191.568505889559, 7373.410127189812, 7385.926140738631, 7385.9630701846145, 7392.408607311402, 476.96184305255497, 490.4800911034315, 491.75658049265127, 492.83736366998806, 502.06866263082185, 5659.349174844946, 5695.629784064023, 5701.372848986691, 5745.9425405745405, 5751.539876809845, 8474.915250847536, 9013.954930225307, 9078.137576930181, 9083.0, 9119.768831207835, 8879.511626860585, 8994.730158095137, 9012.27901767857, 9028.36801423894, 9049.276057915351, 6911.89632155518, 6967.372936435745, 6998.475114366341, 7009.1589009319205, 7126.429885609139, 6722.697478613572, 6751.86496270062, 6772.051912732123, 6787.762428314985, 6792.728290868507, 7867.84264314722, 8085.393595480245, 8086.5148091114725, 8168.305694015838, 8216.21945915137, 8113.432059755761, 8296.25333719944, 8424.620892059995, 8431.114732953198, 8432.915670843213, 6339.936600634119, 6432.742690292524, 6595.868082638416, 6671.33286671329, 6674.399304062657, 7145.1425828900865, 7172.246914073947, 7182.569045857265, 7198.49610527279, 7251.782446526613, 6503.382178693017, 6676.632785196861, 6704.229013663296, 6778.288279730755, 6804.489663275175, 6507.219133703986, 6573.605583664996, 6588.8352791180605, 6637.037629543785, 6679.899801502884, 6514.3811337922825, 6605.735770569124, 6610.206775186816, 6652.83367915806, 6677.76627818024, 6306.117143599808, 6366.93633063682, 6369.299377068426, 6393.1688880445245, 6416.358364163546, 6219.626822390671, 6233.283172435228, 6273.0, 6274.215723034621, 6276.058591211355], "unit": "score", "name": "mootools.html", "value": 4264.214903926454}, {"lowerIsBetter": false, "replicates": [321.5915786950573, 327.2326394604652, 328.5941861800677, 334.2145957001046, 334.76900938352543, 5837.474627283544, 5872.265966754156, 5886.381929897363, 5900.675462849542, 5901.085331773571, 5798.5361171106315, 5800.245968024162, 5802.332731735852, 5805.709714514268, 5816.302043754745, 4311.0, 4459.197344477992, 4520.3219517072375, 4558.361829343895, 4588.518205588415, 4545.545445455461, 4565.292379681138, 4568.109218702338, 4568.109218702354, 4573.222552166123, 4451.287793952968, 4504.369388285642, 4504.729716217021, 4514.074614703978, 4536.160810250098, 4282.892927676802, 4356.411884395614, 4443.888902777424, 4471.39636149119, 4471.6646251531265, 3915.745476544044, 3920.5687374388795, 3930.9017274568077, 3934.527856657191, 3949.2891279569667, 5550.5013646315265, 5553.666779993213, 5572.637778544382, 5572.804951826707, 5573.972130139324, 5188.507091826271, 5189.818356357509, 5189.870253243699, 5192.299039629639, 5195.064888320101, 6091.360407157274, 6119.204503414572, 6120.846978825521, 6130.724117414727, 6150.015997440433, 4088.8160032798596, 4188.434561334211, 4191.036061705794, 4349.13017396522, 4378.452693413324, 6354.3010268870385, 6423.454006409461, 6443.9355606443805, 6446.097546343516, 6456.548041637087, 4326.242907491176, 4357.433533640607, 4369.475662920407, 4375.934360984587, 4378.452693413324, 4416.823327066945, 4423.159599676052, 4423.270160423494, 4425.159219748302, 4425.491068527096, 5091.541761241432, 5103.157978933435, 5134.717590532557, 5136.0, 5145.819896303611, 6010.9699451502465, 6229.314775374705, 6235.657038862815, 6242.625442473466, 6253.937460625427, 1523.603862995629, 1533.9769903451456, 1534.77745726869, 1537.3927298716944, 1537.9000364976241, 930.3208657679932, 1004.3321191407632, 1015.7968406318765, 1029.2332212501585, 1048.4286064094933, 5838.737256823453, 5888.705564721747, 5890.646561206256, 5895.616784908967, 5901.645901245939, 6309.842253943596, 6310.368963103745, 6312.210973628296, 6321.399467050623, 6327.177466929362, 5877.500412464989, 5890.67601281925, 5893.705314734246, 5893.911591326134, 5908.556858235564, 3384.0693809202176, 3401.693847553732, 3406.7615266931075, 3410.556627638391, 3413.9829300853335, 6569.638669873108, 6618.106555615027, 6653.600783952978, 6793.830154246085, 6817.488688348394, 6596.736130554724, 6610.438112760469, 6619.635920024349, 6633.1045308882685, 6652.234992975773, 6762.425193858577, 6766.391024807693, 6792.966035169792, 6800.183977922681, 6823.181218253742, 6437.967810160919, 6457.515686323451, 6463.062855885776, 6471.449926756279, 6485.286618472059, 6218.968905155445, 6404.327545607831, 6416.230052393743, 6418.005209192583, 6422.967885160731, 6790.117284752951, 6807.523473357016, 6810.182778066465, 6816.182058153054, 6826.078479405217, 4279.679024073144, 4286.764227967492, 4288.442502474658, 4294.57054294568, 4300.462442194726, 6458.0, 6461.19235095613, 6465.450436712932, 6468.288488266193, 6473.741050357933, 6265.342139075331, 6269.623822570478, 6277.2153480814895, 6287.088372186099, 6293.150424692608, 6082.452579267887, 6243.594166379171, 6268.993921944933, 6298.370162983665, 6307.211598550181, 6137.202163718688, 6155.107509411021, 6170.0, 6170.629762214281, 6177.320494745664, 6288.371162883675, 6294.15028971083, 6296.464800492009, 6300.936990630218, 6301.6534090625455, 5945.672987985702, 6001.819945401645, 6146.416090471398, 6147.170132032118, 6150.231221097363], "unit": "score", "name": "prototype.html", "value": 4677.441951024799}, {"lowerIsBetter": false, "replicates": [696.6255340051501, 756.4213376766772, 802.7545694496813, 820.9466384684995, 845.3110714767466, 13800.861991380083, 13962.092463989833, 13966.720665586696, 13979.51071712489, 14016.369263383147, 13055.477780888777, 13075.084744067919, 13093.279869607168, 13094.148880322773, 14445.0, 831.5343407691681, 844.3456321350941, 849.7280870121564, 850.6639877248483, 850.8936382952131, 828.6519661742083, 838.6771093129158, 838.9161083891623, 839.0, 839.1734141870253, 896.6144557840126, 898.8427025270585, 899.6851102114273, 899.8605216191501, 900.4867225681364, 891.8617614269799, 899.6401439424217, 900.0144841398658, 900.428228075177, 901.0178904993523, 659.7427003468651, 662.9668516574152, 663.2538394306405, 663.6880666086931, 664.4750646988873, 13743.931280343535, 13764.449422023106, 13766.380512876945, 13767.518136865261, 13783.173009619355, 12511.93744031274, 12668.36658167088, 12784.105112642119, 12910.87089129106, 13016.804747928789, 10422.84365734507, 10449.738756531071, 10644.361338319726, 10744.785104297871, 11191.384473853936, 3627.147620309225, 3647.3832480260194, 3670.229251857113, 3774.8112594370173, 3781.829817658212, 47597.76201118972, 47681.76159119217, 47686.523134768555, 47701.522984770054, 47723.76138119322, 9647.758806029906, 10001.599936002624, 10123.1901447884, 10176.694699159038, 10522.631707890187, 18885.527861803566, 18896.149673264736, 18914.24343026291, 18924.0, 18973.335933242546, 7369.373603243677, 7406.259374062658, 7511.211322811027, 7636.350910172698, 7738.690452381954, 4172.603602657743, 4296.806643701041, 4348.717333373321, 4421.712588681726, 4624.722516649012, 3000.489916714164, 3004.278973046497, 3021.320202954362, 3023.2441889527618, 3027.197792584967, 525.0889706359463, 541.0207524380883, 541.3476760503584, 542.7286356821589, 543.665645627936, 495.7496464285513, 543.7525925703795, 566.6345207341242, 655.131950166032, 661.4311691944923, 7763.456558040996, 7999.5600241986085, 8070.475419097857, 8149.062857771313, 8209.425340226127, 619.9411055949678, 628.9811305660837, 643.5077165968038, 656.55760570677, 657.1687310408279, 3667.7357152134623, 3796.7788843526846, 3806.238752249506, 3825.827837747308, 3850.5367960174954, 53694.7315263429, 53859.73070134624, 54703.0, 54718.726406367714, 54906.72546637241, 47094.76452617784, 47631.0, 48059.75970120197, 48585.5141448581, 49218.507814921395, 39003.41494877579, 42876.35685464721, 43707.0, 44678.55321446809, 46348.7682561585, 7931.405144614062, 8110.594470276581, 8132.67469301245, 8170.509769413854, 8313.168683131638, 32357.51463727999, 33470.832645836614, 33666.66333336733, 34266.14334641654, 34301.65698342985, 39341.803290983364, 39399.40900886546, 42240.577594223665, 42361.57638423576, 43171.35242971295, 10870.782584348426, 11230.55077796879, 11283.887161128283, 11503.309801411942, 11582.420878956187, 11845.11161662896, 11940.70148246266, 12298.385080745747, 12384.75230495403, 12490.437930293341, 10832.783344332911, 11071.446427678746, 11149.609763658233, 11185.88814111881, 11329.263597866113, 11220.270682405617, 11599.130065244972, 11657.53369865196, 11867.465964031466, 11938.58214962472, 10070.0, 10304.536295866554, 10452.843207352047, 10456.686299410725, 10462.947685261524, 9252.814943700954, 9620.567074481525, 9638.710838674851, 9644.276679249224, 9757.414555126716, 8576.78558036029, 8617.224449799549, 9006.864897026418, 9036.638534458549, 9413.305604991167], "unit": "score", "name": "yui.html", "value": 6245.616170715381}], "name": "dromaeo_css", "value": 6680.151889511227}, {"lowerIsBetter": true, "subtests": [{"lowerIsBetter": true, "replicates": [113.0, 114.0, 108.0, 115.0, 112.0, 112.0, 103.0, 111.0, 112.0, 113.0], "unit": "score", "name": "ai-astar", "value": 111.3}, {"lowerIsBetter": true, "replicates": [152.0, 134.0, 162.0, 168.0, 133.0, 160.0, 153.0, 132.0, 166.0, 126.0], "unit": "score", "name": "audio-beat-detection", "value": 148.6}, {"lowerIsBetter": true, "replicates": [162.0, 166.0, 163.0, 164.0, 165.0, 161.0, 164.0, 164.0, 164.0, 164.0], "unit": "score", "name": "audio-dft", "value": 163.7}, {"lowerIsBetter": true, "replicates": [75.0, 74.0, 109.0, 95.0, 75.0, 74.0, 73.0, 109.0, 94.0, 72.0], "unit": "score", "name": "audio-fft", "value": 85.0}, {"lowerIsBetter": true, "replicates": [98.0, 98.0, 143.0, 97.0, 97.0, 98.0, 154.0, 97.0, 97.0, 136.0], "unit": "score", "name": "audio-oscillator", "value": 111.5}, {"lowerIsBetter": true, "replicates": [119.0, 115.0, 115.0, 115.0, 115.0, 114.0, 116.0, 115.0, 115.0, 115.0], "unit": "score", "name": "imaging-gaussian-blur", "value": 115.4}, {"lowerIsBetter": true, "replicates": [147.0, 146.0, 148.0, 146.0, 147.0, 146.0, 147.0, 146.0, 146.0, 147.0], "unit": "score", "name": "imaging-darkroom", "value": 146.6}, {"lowerIsBetter": true, "replicates": [96.0, 96.0, 96.0, 96.0, 96.0, 96.0, 97.0, 96.0, 96.0, 96.0], "unit": "score", "name": "imaging-desaturate", "value": 96.1}, {"lowerIsBetter": true, "replicates": [58.0, 57.0, 57.0, 56.0, 58.0, 56.0, 59.0, 70.0, 54.0, 53.0], "unit": "score", "name": "json-parse-financial", "value": 57.8}, {"lowerIsBetter": true, "replicates": [68.0, 68.0, 68.0, 68.0, 69.0, 67.0, 68.0, 69.0, 69.0, 68.0], "unit": "score", "name": "json-stringify-tinderbox", "value": 68.2}, {"lowerIsBetter": true, "replicates": [83.0, 91.0, 84.0, 85.0, 86.0, 83.0, 83.0, 94.0, 84.0, 84.0], "unit": "score", "name": "stanford-crypto-aes", "value": 85.7}, {"lowerIsBetter": true, "replicates": [122.0, 118.0, 119.0, 127.0, 126.0, 122.0, 120.0, 132.0, 122.0, 122.0], "unit": "score", "name": "stanford-crypto-ccm", "value": 123.0}, {"lowerIsBetter": true, "replicates": [148.0, 144.0, 155.0, 155.0, 153.0, 143.0, 158.0, 162.0, 154.0, 144.0], "unit": "score", "name": "stanford-crypto-pbkdf2", "value": 151.6}, {"lowerIsBetter": true, "replicates": [71.0, 72.0, 71.0, 70.0, 71.0, 72.0, 69.0, 74.0, 72.0, 69.0], "unit": "score", "name": "stanford-crypto-sha256-iterative", "value": 71.1}], "name": "kraken", "value": 1535.6}]} 11:58:57 INFO - TinderboxPrint: TalosResult: {"graphserver": {"kraken": {"url": "http://graphs.mozilla.org/graph.html#tests=[[232,64,35]]", "result": "1535.60"}, "dromaeo_css": {"url": "http://graphs.mozilla.org/graph.html#tests=[[72,64,35]]", "result": "6680.15"}}} 11:58:57 INFO - Return code: 0 11:58:58 INFO - Validating PERFHERDER_DATA against /builds/slave/test-pgo/build/tests/talos/treeherder-schemas/performance-artifact.json 11:58:58 INFO - # TBPL SUCCESS # 11:58:58 INFO - Running post-action listener: _resource_record_post_action 11:58:58 INFO - Running post-run listener: _resource_record_post_run 11:58:59 INFO - Total resource usage - Wall time: 1190s; CPU: 13.0%; Read bytes: 24576; Write bytes: 540921856; Read time: 356; Write time: 632016 11:58:59 INFO - install - Wall time: 17s; CPU: 15.0%; Read bytes: 0; Write bytes: 240996352; Read time: 0; Write time: 353080 11:58:59 INFO - run-tests - Wall time: 1174s; CPU: 13.0%; Read bytes: 24576; Write bytes: 299851776; Read time: 356; Write time: 278920 11:58:59 INFO - Running post-run listener: _upload_blobber_files 11:58:59 INFO - Blob upload gear active. 11:58:59 INFO - Preparing to upload files from /builds/slave/test-pgo/build/blobber_upload_dir. 11:58:59 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 11:58:59 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'] 11:58:59 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 11:58:59 INFO - (blobuploader) - INFO - Open directory for files ... 11:58:59 INFO - (blobuploader) - INFO - Uploading /builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs_raw.log ... 11:58:59 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 11:58:59 INFO - (blobuploader) - INFO - Uploading, attempt #1. 11:59:00 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_raw.log: uploaded 11:59:00 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 11:59:00 INFO - (blobuploader) - INFO - Done attempting. 11:59:00 INFO - (blobuploader) - INFO - Uploading /builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs_errorsummary.log ... 11:59:00 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 11:59:00 INFO - (blobuploader) - INFO - Uploading, attempt #1. 11:59:01 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_errorsummary.log: uploaded 11:59:01 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 11:59:01 INFO - (blobuploader) - INFO - Done attempting. 11:59:01 INFO - (blobuploader) - INFO - Iteration through files over. 11:59:01 INFO - Return code: 0 11:59:01 INFO - rmtree: /builds/slave/test-pgo/build/uploaded_files.json 11:59:01 INFO - retry: Calling remove with args: ('/builds/slave/test-pgo/build/uploaded_files.json',), kwargs: {}, attempt #1 11:59:01 INFO - Setting buildbot property blobber_files to {"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/1f5a48e3acd21d00cc5882e65406f1e26f0537fa8a839ef5a8a9144bba05a72fed988b577eee6ed5cb994267c769aa7dd9e0e8f1211046b824e170c9e71de074", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/08340c3dfc36740b82571c34feb6406dfde1795a3ce1449e781d9ab436a5337b2c63554974ecf47ce7c63f845a504ccb5eeece9cb1a92147a4c2d302fc59d47d"} 11:59:01 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test-pgo/properties/blobber_files 11:59:01 INFO - Writing to file /builds/slave/test-pgo/properties/blobber_files 11:59:01 INFO - Contents: 11:59:01 INFO - blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/1f5a48e3acd21d00cc5882e65406f1e26f0537fa8a839ef5a8a9144bba05a72fed988b577eee6ed5cb994267c769aa7dd9e0e8f1211046b824e170c9e71de074", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/08340c3dfc36740b82571c34feb6406dfde1795a3ce1449e781d9ab436a5337b2c63554974ecf47ce7c63f845a504ccb5eeece9cb1a92147a4c2d302fc59d47d"} 11:59:01 INFO - Running post-run listener: copy_logs_to_upload_dir 11:59:01 INFO - Copying logs to upload dir... 11:59:01 INFO - mkdir: /builds/slave/test-pgo/build/upload/logs 11:59:01 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1231.287066 ========= master_lag: 0.02 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 31 secs) (at 2016-02-29 11:59:01.161217) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-02-29 11:59:01.164991) ========= 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=a4ce256d2ec601f24a60a71e000001bc-1456774677.566774-1852363187 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/1f5a48e3acd21d00cc5882e65406f1e26f0537fa8a839ef5a8a9144bba05a72fed988b577eee6ed5cb994267c769aa7dd9e0e8f1211046b824e170c9e71de074", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/08340c3dfc36740b82571c34feb6406dfde1795a3ce1449e781d9ab436a5337b2c63554974ecf47ce7c63f845a504ccb5eeece9cb1a92147a4c2d302fc59d47d"} build_url:https://queue.taskcluster.net/v1/task/JVZ9Gd0AQk6ucaWKcJEwOA/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.011301 build_url: 'https://queue.taskcluster.net/v1/task/JVZ9Gd0AQk6ucaWKcJEwOA/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/1f5a48e3acd21d00cc5882e65406f1e26f0537fa8a839ef5a8a9144bba05a72fed988b577eee6ed5cb994267c769aa7dd9e0e8f1211046b824e170c9e71de074", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/08340c3dfc36740b82571c34feb6406dfde1795a3ce1449e781d9ab436a5337b2c63554974ecf47ce7c63f845a504ccb5eeece9cb1a92147a4c2d302fc59d47d"}' ========= master_lag: 0.01 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-02-29 11:59:01.189877) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-02-29 11:59:01.190169) ========= 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=a4ce256d2ec601f24a60a71e000001bc-1456774677.566774-1852363187 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004544 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-02-29 11:59:01.274175) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-02-29 11:59:01.274471) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-02-29 11:59:01.274743) ========= ========= Total master_lag: 0.38 =========