builder: fx-team_ubuntu64_hw_test-dromaeojs-e10s-pgo slave: talos-linux64-ix-016 starttime: 1458259230.43 results: success (0) buildid: 20160317143606 builduid: 0ce4d8d2198047fdb51f4ca7bd7bec97 revision: 1477dcbfb8ec44166c93473932a475a3c4dec17f ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-03-17 17:00:30.434477) ========= master: http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-03-17 17:00:30.434929) ========= ========= Started set props: basedir (results: 0, elapsed: 0 secs) (at 2016-03-17 17:00:30.435257) ========= 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=00204705a9daa57ed339a427000001b9-1458258052.594903-820213356 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False /builds/slave/test-pgo program finished with exit code 0 elapsedTime=0.006357 basedir: '/builds/slave/test-pgo' ========= master_lag: 0.03 ========= ========= Finished set props: basedir (results: 0, elapsed: 0 secs) (at 2016-03-17 17:00:30.471902) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-03-17 17:00:30.472233) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-03-17 17:00:30.548218) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-03-17 17:00:30.548559) ========= 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=00204705a9daa57ed339a427000001b9-1458258052.594903-820213356 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004729 ========= master_lag: 0.05 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-03-17 17:00:30.605911) ========= ========= Started set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2016-03-17 17:00:30.606604) ========= script_repo_url: https://hg.mozilla.org/build/mozharness ========= Finished set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2016-03-17 17:00:30.607475) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-03-17 17:00:30.608235) ========= 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=00204705a9daa57ed339a427000001b9-1458258052.594903-820213356 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2016-03-17 17:00:30-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org (hg.mozilla.org)... 63.245.215.25, 63.245.215.102 Connecting to hg.mozilla.org (hg.mozilla.org)|63.245.215.25|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12141 (12K) [text/x-python] Saving to: `archiver_client.py' 0K .......... . 100% 46.2M=0s 2016-03-17 17:00:31 (46.2 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.161141 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-03-17 17:00:30.791790) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-03-17 17:00:30.792512) ========= 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=00204705a9daa57ed339a427000001b9-1458258052.594903-820213356 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.015169 ========= master_lag: 0.04 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-03-17 17:00:30.846387) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-03-17 17:00:30.847197) ========= bash -c 'python archiver_client.py mozharness --repo integration/fx-team --rev 1477dcbfb8ec44166c93473932a475a3c4dec17f --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 1477dcbfb8ec44166c93473932a475a3c4dec17f --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=00204705a9daa57ed339a427000001b9-1458258052.594903-820213356 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2016-03-17 17:00:31,224 truncating revision to first 12 chars 2016-03-17 17:00:31,224 Setting DEBUG logging. 2016-03-17 17:00:31,224 attempt 1/10 2016-03-17 17:00:31,224 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/integration/fx-team/1477dcbfb8ec?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-03-17 17:00:31,478 unpacking tar archive at: fx-team-1477dcbfb8ec/testing/mozharness/ program finished with exit code 0 elapsedTime=0.540090 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-03-17 17:00:31.400386) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-03-17 17:00:31.400935) ========= echo 1477dcbfb8ec44166c93473932a475a3c4dec17f in dir /builds/slave/test-pgo/. (timeout 1200 secs) watching logfiles {} argv: ['echo', u'1477dcbfb8ec44166c93473932a475a3c4dec17f'] 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=00204705a9daa57ed339a427000001b9-1458258052.594903-820213356 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 1477dcbfb8ec44166c93473932a475a3c4dec17f program finished with exit code 0 elapsedTime=0.004687 script_repo_revision: '1477dcbfb8ec44166c93473932a475a3c4dec17f' ========= master_lag: 0.05 ========= ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-03-17 17:00:31.451540) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-03-17 17:00:31.451878) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-03-17 17:00:31.467764) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 39 secs) (at 2016-03-17 17:00:31.468100) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Fx-Team --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Fx-Team in dir /builds/slave/test-pgo/. (timeout 3600 secs) (maxTime 7200 secs) watching logfiles {} argv: ['/tools/buildbot/bin/python', 'scripts/scripts/talos_script.py', '--suite', 'dromaeojs-e10s', '--add-option', '--webServer,localhost', '--branch-name', 'Fx-Team', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Fx-Team'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PROPERTIES_FILE=/builds/slave/test-pgo/buildprops.json PWD=/builds/slave/test-pgo SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=00204705a9daa57ed339a427000001b9-1458258052.594903-820213356 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 17:00:31 INFO - MultiFileLogger online at 20160317 17:00:31 in /builds/slave/test-pgo 17:00:31 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Fx-Team --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Fx-Team 17:00:31 INFO - Dumping config to /builds/slave/test-pgo/logs/localconfig.json. 17:00:31 INFO - {'append_to_log': False, 17:00:31 INFO - 'base_work_dir': '/builds/slave/test-pgo', 17:00:31 INFO - 'blob_upload_branch': 'Fx-Team', 17:00:31 INFO - 'blob_uploader_auth_file': '/builds/slave/test-pgo/oauth.txt', 17:00:31 INFO - 'branch': 'Fx-Team', 17:00:31 INFO - 'buildbot_json_path': 'buildprops.json', 17:00:31 INFO - 'config_files': ('talos/linux_config.py',), 17:00:31 INFO - 'default_actions': ('clobber', 17:00:31 INFO - 'read-buildbot-config', 17:00:31 INFO - 'download-and-extract', 17:00:31 INFO - 'populate-webroot', 17:00:31 INFO - 'create-virtualenv', 17:00:31 INFO - 'install', 17:00:31 INFO - 'run-tests'), 17:00:31 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 17:00:31 INFO - 'download_minidump_stackwalk': True, 17:00:31 INFO - 'download_symbols': 'ondemand', 17:00:31 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 17:00:31 INFO - 'tooltool.py': '/tools/tooltool.py', 17:00:31 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 17:00:31 INFO - '/tools/misc-python/virtualenv.py')}, 17:00:31 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 17:00:31 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 17:00:31 INFO - 'installer_path': 'installer.exe', 17:00:31 INFO - 'log_level': 'info', 17:00:31 INFO - 'log_name': 'talos', 17:00:31 INFO - 'log_to_console': True, 17:00:31 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 17:00:31 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 17:00:31 INFO - 'opt_config_files': (), 17:00:31 INFO - 'pip_index': False, 17:00:31 INFO - 'sps_profile': False, 17:00:31 INFO - 'sps_profile_interval': 0, 17:00:31 INFO - 'suite': 'dromaeojs-e10s', 17:00:31 INFO - 'system_bits': '32', 17:00:31 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 17:00:31 INFO - 'title': 'talos-linux64-ix-016', 17:00:31 INFO - 'tooltool_cache': '/builds/tooltool_cache', 17:00:31 INFO - 'use_talos_json': True, 17:00:31 INFO - 'virtualenv_path': '/builds/slave/test-pgo/build/venv', 17:00:31 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 17:00:31 INFO - 'work_dir': 'build'} 17:00:31 INFO - ##### 17:00:31 INFO - ##### Running clobber step. 17:00:31 INFO - ##### 17:00:31 INFO - Running pre-action listener: _resource_record_pre_action 17:00:31 INFO - Running main action method: clobber 17:00:31 INFO - rmtree: /builds/slave/test-pgo/build 17:00:31 INFO - retry: Calling rmtree with args: ('/builds/slave/test-pgo/build',), kwargs: {}, attempt #1 17:00:32 INFO - Running post-action listener: _resource_record_post_action 17:00:32 INFO - ##### 17:00:32 INFO - ##### Running read-buildbot-config step. 17:00:32 INFO - ##### 17:00:32 INFO - Running pre-action listener: _resource_record_pre_action 17:00:32 INFO - Running main action method: read_buildbot_config 17:00:32 INFO - Using buildbot properties: 17:00:32 INFO - { 17:00:32 INFO - "project": "", 17:00:32 INFO - "product": "firefox", 17:00:32 INFO - "script_repo_revision": "production", 17:00:32 INFO - "builddir": "fx-team_ubuntu64_hw_test-dromaeojs-e10s", 17:00:32 INFO - "repository": "", 17:00:32 INFO - "buildername": "Ubuntu HW 12.04 x64 fx-team pgo talos dromaeojs-e10s", 17:00:32 INFO - "buildid": "20160317143606", 17:00:32 INFO - "pgo_build": "True", 17:00:32 INFO - "basedir": "/builds/slave/test-pgo", 17:00:32 INFO - "buildnumber": 573, 17:00:32 INFO - "slavename": "talos-linux64-ix-016", 17:00:32 INFO - "master": "http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/", 17:00:32 INFO - "platform": "ubuntu64_hw", 17:00:32 INFO - "scheduler": "tests-fx-team-linux64-pgo-talos", 17:00:32 INFO - "branch": "fx-team", 17:00:32 INFO - "repo_path": "integration/fx-team", 17:00:32 INFO - "revision": "1477dcbfb8ec44166c93473932a475a3c4dec17f", 17:00:32 INFO - "stage_platform": "linux64-pgo", 17:00:32 INFO - "builduid": "0ce4d8d2198047fdb51f4ca7bd7bec97", 17:00:32 INFO - "slavebuilddir": "test" 17:00:32 INFO - } 17:00:32 INFO - Found installer url https://queue.taskcluster.net/v1/task/OFRwGw3xRmOVFero6ljGbQ/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2. 17:00:32 INFO - Running post-action listener: _resource_record_post_action 17:00:32 INFO - ##### 17:00:32 INFO - ##### Running download-and-extract step. 17:00:32 INFO - ##### 17:00:32 INFO - Running pre-action listener: _resource_record_pre_action 17:00:32 INFO - Running main action method: download_and_extract 17:00:32 INFO - mkdir: /builds/slave/test-pgo/build/tests 17:00:32 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 17:00:32 INFO - https://queue.taskcluster.net/v1/task/OFRwGw3xRmOVFero6ljGbQ/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.test_packages.json matches https://queue.taskcluster.net 17:00:32 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/OFRwGw3xRmOVFero6ljGbQ/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.test_packages.json 17:00:32 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/OFRwGw3xRmOVFero6ljGbQ/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.test_packages.json 17:00:32 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/OFRwGw3xRmOVFero6ljGbQ/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.test_packages.json to /builds/slave/test-pgo/build/firefox-48.0a1.en-US.linux-x86_64.test_packages.json 17:00:32 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/OFRwGw3xRmOVFero6ljGbQ/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.test_packages.json', 'file_name': '/builds/slave/test-pgo/build/firefox-48.0a1.en-US.linux-x86_64.test_packages.json'}, attempt #1 17:00:39 INFO - Downloaded 1361 bytes. 17:00:39 INFO - Reading from file /builds/slave/test-pgo/build/firefox-48.0a1.en-US.linux-x86_64.test_packages.json 17:00:39 INFO - Using the following test package requirements: 17:00:39 INFO - {u'common': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip'], 17:00:39 INFO - u'cppunittest': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 17:00:39 INFO - u'firefox-48.0a1.en-US.linux-x86_64.cppunittest.tests.zip'], 17:00:39 INFO - u'gtest': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 17:00:39 INFO - u'firefox-48.0a1.en-US.linux-x86_64.gtest.tests.zip'], 17:00:39 INFO - u'jittest': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 17:00:39 INFO - u'jsshell-linux-x86_64.zip'], 17:00:39 INFO - u'mochitest': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 17:00:39 INFO - u'firefox-48.0a1.en-US.linux-x86_64.mochitest.tests.zip'], 17:00:39 INFO - u'mozbase': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip'], 17:00:39 INFO - u'reftest': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 17:00:39 INFO - u'firefox-48.0a1.en-US.linux-x86_64.reftest.tests.zip'], 17:00:39 INFO - u'talos': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 17:00:39 INFO - u'firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip'], 17:00:39 INFO - u'web-platform': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 17:00:39 INFO - u'firefox-48.0a1.en-US.linux-x86_64.web-platform.tests.zip'], 17:00:39 INFO - u'xpcshell': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 17:00:39 INFO - u'firefox-48.0a1.en-US.linux-x86_64.xpcshell.tests.zip']} 17:00:39 INFO - Downloading packages: [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 17:00:39 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://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')]} 17:00:39 INFO - https://queue.taskcluster.net/v1/task/OFRwGw3xRmOVFero6ljGbQ/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 17:00:39 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/OFRwGw3xRmOVFero6ljGbQ/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip 17:00:39 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/OFRwGw3xRmOVFero6ljGbQ/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip 17:00:39 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/OFRwGw3xRmOVFero6ljGbQ/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test-pgo/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip 17:00:39 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/OFRwGw3xRmOVFero6ljGbQ/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test-pgo/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 17:00:47 INFO - Downloaded 23578867 bytes. 17:00:47 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test-pgo/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test-pgo/build/tests'] 17:00:47 INFO - Copy/paste: unzip -q -o /builds/slave/test-pgo/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test-pgo/build/tests 17:00:48 INFO - Return code: 0 17:00:48 INFO - Downloading packages: [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', u'firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip'] for test suite category: talos 17:00:48 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 17:00:48 INFO - https://queue.taskcluster.net/v1/task/OFRwGw3xRmOVFero6ljGbQ/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 17:00:48 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/OFRwGw3xRmOVFero6ljGbQ/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip 17:00:48 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/OFRwGw3xRmOVFero6ljGbQ/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip 17:00:48 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/OFRwGw3xRmOVFero6ljGbQ/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test-pgo/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip 17:00:48 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/OFRwGw3xRmOVFero6ljGbQ/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test-pgo/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 17:00:49 INFO - Downloaded 23578867 bytes. 17:00:49 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test-pgo/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test-pgo/build/tests'] 17:00:49 INFO - Copy/paste: unzip -q -o /builds/slave/test-pgo/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test-pgo/build/tests 17:00:51 INFO - Return code: 0 17:00: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')]} 17:00:51 INFO - https://queue.taskcluster.net/v1/task/OFRwGw3xRmOVFero6ljGbQ/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip matches https://queue.taskcluster.net 17:00:51 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/OFRwGw3xRmOVFero6ljGbQ/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip 17:00:51 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/OFRwGw3xRmOVFero6ljGbQ/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip 17:00:51 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/OFRwGw3xRmOVFero6ljGbQ/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip to /builds/slave/test-pgo/build/firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip 17:00:51 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/OFRwGw3xRmOVFero6ljGbQ/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip', 'file_name': u'/builds/slave/test-pgo/build/firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip'}, attempt #1 17:00:52 INFO - Downloaded 10846565 bytes. 17:00:52 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test-pgo/build/firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip', '-d', '/builds/slave/test-pgo/build/tests'] 17:00:52 INFO - Copy/paste: unzip -q -o /builds/slave/test-pgo/build/firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip -d /builds/slave/test-pgo/build/tests 17:00:52 INFO - Return code: 0 17:00:52 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')]} 17:00:52 INFO - https://queue.taskcluster.net/v1/task/OFRwGw3xRmOVFero6ljGbQ/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2 matches https://queue.taskcluster.net 17:00:52 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/OFRwGw3xRmOVFero6ljGbQ/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2 17:00:52 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/OFRwGw3xRmOVFero6ljGbQ/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2 17:00:52 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/OFRwGw3xRmOVFero6ljGbQ/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2 to /builds/slave/test-pgo/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2 17:00:52 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/OFRwGw3xRmOVFero6ljGbQ/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2', 'file_name': '/builds/slave/test-pgo/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2'}, attempt #1 17:00:53 INFO - Downloaded 57657728 bytes. 17:00:53 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/OFRwGw3xRmOVFero6ljGbQ/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2 17:00:53 INFO - mkdir: /builds/slave/test-pgo/properties 17:00:53 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test-pgo/properties/build_url 17:00:53 INFO - Writing to file /builds/slave/test-pgo/properties/build_url 17:00:53 INFO - Contents: 17:00:53 INFO - build_url:https://queue.taskcluster.net/v1/task/OFRwGw3xRmOVFero6ljGbQ/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2 17:00:54 INFO - Running post-action listener: _resource_record_post_action 17:00:54 INFO - Running post-action listener: set_extra_try_arguments 17:00:54 INFO - ##### 17:00:54 INFO - ##### Running populate-webroot step. 17:00:54 INFO - ##### 17:00:54 INFO - Running pre-action listener: _resource_record_pre_action 17:00:54 INFO - Running main action method: populate_webroot 17:00:54 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 17:00:54 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 17:00:54 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 17:00:54 INFO - '--tppagecycles', 17:00:54 INFO - '7'], 17:00:54 INFO - 'tests': ['tsvgm']}}, 17:00:54 INFO - 'suites': {'chromez': {'tests': ['tresize', 'tcanvasmark']}, 17:00:54 INFO - 'chromez-e10s': {'talos_options': ['--e10s'], 17:00:54 INFO - 'tests': ['tresize', 'tcanvasmark']}, 17:00:54 INFO - 'dromaeojs': {'tests': ['dromaeo_css', 'kraken']}, 17:00:54 INFO - 'dromaeojs-e10s': {'talos_options': ['--e10s'], 17:00:54 INFO - 'tests': ['dromaeo_css', 'kraken']}, 17:00:54 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 17:00:54 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 17:00:54 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 17:00:54 INFO - 'talos_options': ['--e10s'], 17:00:54 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 17:00:54 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 17:00:54 INFO - 'tests': ['damp', 'tps']}, 17:00:54 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 17:00:54 INFO - 'talos_options': ['--e10s'], 17:00:54 INFO - 'tests': ['damp', 'tps']}, 17:00:54 INFO - 'g3': {'tests': ['dromaeo_dom']}, 17:00:54 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 17:00:54 INFO - 'other': {'tests': ['a11yr', 17:00:54 INFO - 'ts_paint', 17:00:54 INFO - 'tpaint', 17:00:54 INFO - 'sessionrestore', 17:00:54 INFO - 'sessionrestore_no_auto_restore', 17:00:54 INFO - 'tabpaint']}, 17:00:54 INFO - 'other-e10s': {'talos_options': ['--e10s'], 17:00:54 INFO - 'tests': ['a11yr', 17:00:54 INFO - 'ts_paint', 17:00:54 INFO - 'tpaint', 17:00:54 INFO - 'sessionrestore', 17:00:54 INFO - 'sessionrestore_no_auto_restore', 17:00:54 INFO - 'tabpaint']}, 17:00:54 INFO - 'other-e10s_l64': {'talos_options': ['--e10s'], 17:00:54 INFO - 'tests': ['a11yr', 17:00:54 INFO - 'ts_paint', 17:00:54 INFO - 'tpaint', 17:00:54 INFO - 'sessionrestore', 17:00:54 INFO - 'sessionrestore_no_auto_restore', 17:00:54 INFO - 'tabpaint']}, 17:00:54 INFO - 'other-e10s_nol64': {'talos_options': ['--e10s'], 17:00:54 INFO - 'tests': ['a11yr', 17:00:54 INFO - 'ts_paint', 17:00:54 INFO - 'tpaint', 17:00:54 INFO - 'sessionrestore', 17:00:54 INFO - 'sessionrestore_no_auto_restore', 17:00:54 INFO - 'tabpaint']}, 17:00:54 INFO - 'other_l64': {'tests': ['a11yr', 17:00:54 INFO - 'ts_paint', 17:00:54 INFO - 'tpaint', 17:00:54 INFO - 'sessionrestore', 17:00:54 INFO - 'sessionrestore_no_auto_restore', 17:00:54 INFO - 'tabpaint']}, 17:00:54 INFO - 'other_nol64': {'tests': ['a11yr', 17:00:54 INFO - 'ts_paint', 17:00:54 INFO - 'tpaint', 17:00:54 INFO - 'sessionrestore', 17:00:54 INFO - 'sessionrestore_no_auto_restore', 17:00:54 INFO - 'tabpaint']}, 17:00:54 INFO - 'svgr': {'tests': ['tsvgx', 17:00:54 INFO - 'tsvgr_opacity', 17:00:54 INFO - 'tart', 17:00:54 INFO - 'tscrollx', 17:00:54 INFO - 'cart']}, 17:00:54 INFO - 'svgr-e10s': {'talos_options': ['--e10s'], 17:00:54 INFO - 'tests': ['tsvgx', 17:00:54 INFO - 'tsvgr_opacity', 17:00:54 INFO - 'tart', 17:00:54 INFO - 'tscrollx', 17:00:54 INFO - 'cart']}, 17:00:54 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 17:00:54 INFO - 'tests': ['tp5o']}, 17:00:54 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 17:00:54 INFO - 'talos_options': ['--e10s'], 17:00:54 INFO - 'tests': ['tp5o']}, 17:00:54 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 17:00:54 INFO - 'talos_options': ['--xperf_path', 17:00:54 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 17:00:54 INFO - 'tests': ['tp5n']}, 17:00:54 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 17:00:54 INFO - 'talos_options': ['--e10s', 17:00:54 INFO - '--xperf_path', 17:00:54 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 17:00:54 INFO - 'tests': ['tp5n']}}, 17:00:54 INFO - 'talos.zip': {'path': '', 17:00:54 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 17:00:54 INFO - Running post-action listener: _resource_record_post_action 17:00:54 INFO - ##### 17:00:54 INFO - ##### Running create-virtualenv step. 17:00:54 INFO - ##### 17:00:54 INFO - Running pre-action listener: _resource_record_pre_action 17:00:54 INFO - Running main action method: create_virtualenv 17:00:54 INFO - Creating virtualenv /builds/slave/test-pgo/build/venv 17:00:54 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 17:00:54 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test-pgo/build/venv 17:00:54 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 17:00:54 INFO - Using real prefix '/usr' 17:00:54 INFO - New python executable in /builds/slave/test-pgo/build/venv/bin/python 17:00:55 INFO - Installing distribute.............................................................................................................................................................................................done. 17:00:57 INFO - Installing pip.................done. 17:00:57 INFO - Return code: 0 17:00:57 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test-pgo/build/venv 17:00:57 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 17:00:57 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 17:00:57 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:00:57 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 17:00:57 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 17:00:57 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:00:57 INFO - retry: Calling run_command with args: [['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f592ff9cf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x142d8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x14f98d0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x15888b0>, '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 0x15897b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1589c60>, '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': '00204705a9daa57ed339a427000001b9-1458258052.594903-820213356', '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 17:00:57 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5'] in /builds/slave/test-pgo/build 17:00:57 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub pip>=1.5 17:00:57 INFO - Using env: {'DISPLAY': ':0', 17:00:57 INFO - 'HOME': '/home/cltbld', 17:00:57 INFO - 'LANG': 'en_US.UTF-8', 17:00:57 INFO - 'LANGUAGE': 'en_US:en', 17:00:57 INFO - 'LOGNAME': 'cltbld', 17:00:57 INFO - 'MAIL': '/var/mail/cltbld', 17:00:57 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 17:00:57 INFO - 'MOZ_NO_REMOTE': '1', 17:00:57 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 17:00:57 INFO - 'NO_EM_RESTART': '1', 17:00:57 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 17:00:57 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 17:00:57 INFO - 'PWD': '/builds/slave/test-pgo', 17:00:57 INFO - 'SHELL': '/bin/bash', 17:00:57 INFO - 'SHLVL': '1', 17:00:57 INFO - 'TERM': 'linux', 17:00:57 INFO - 'TMOUT': '86400', 17:00:57 INFO - 'USER': 'cltbld', 17:00:57 INFO - 'XDG_SESSION_COOKIE': '00204705a9daa57ed339a427000001b9-1458258052.594903-820213356', 17:00:57 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 17:00:57 INFO - '_': '/tools/buildbot/bin/python'} 17:00:57 INFO - Ignoring indexes: https://pypi.python.org/simple/ 17:00:57 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 17:00:57 INFO - Cleaning up... 17:00:57 INFO - Return code: 0 17:00:57 INFO - Installing psutil>=0.7.1 into virtualenv /builds/slave/test-pgo/build/venv 17:00:57 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 17:00:57 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 17:00:57 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:00:57 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 17:00:57 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 17:00:57 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:00:57 INFO - retry: Calling run_command with args: [['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', '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 0x7f592ff9cf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x142d8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x14f98d0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x15888b0>, '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 0x15897b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1589c60>, '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': '00204705a9daa57ed339a427000001b9-1458258052.594903-820213356', '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 17:00:57 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=0.7.1'] in /builds/slave/test-pgo/build 17:00:57 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub psutil>=0.7.1 17:00:57 INFO - Using env: {'DISPLAY': ':0', 17:00:57 INFO - 'HOME': '/home/cltbld', 17:00:57 INFO - 'LANG': 'en_US.UTF-8', 17:00:57 INFO - 'LANGUAGE': 'en_US:en', 17:00:57 INFO - 'LOGNAME': 'cltbld', 17:00:57 INFO - 'MAIL': '/var/mail/cltbld', 17:00:57 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 17:00:57 INFO - 'MOZ_NO_REMOTE': '1', 17:00:57 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 17:00:57 INFO - 'NO_EM_RESTART': '1', 17:00:57 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 17:00:57 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 17:00:57 INFO - 'PWD': '/builds/slave/test-pgo', 17:00:57 INFO - 'SHELL': '/bin/bash', 17:00:57 INFO - 'SHLVL': '1', 17:00:57 INFO - 'TERM': 'linux', 17:00:57 INFO - 'TMOUT': '86400', 17:00:57 INFO - 'USER': 'cltbld', 17:00:57 INFO - 'XDG_SESSION_COOKIE': '00204705a9daa57ed339a427000001b9-1458258052.594903-820213356', 17:00:57 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 17:00:57 INFO - '_': '/tools/buildbot/bin/python'} 17:00:57 INFO - Ignoring indexes: https://pypi.python.org/simple/ 17:00:57 INFO - Downloading/unpacking psutil>=0.7.1 17:00:57 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 17:00:57 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 17:00:57 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 17:00:57 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 17:00:57 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 17:00:57 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 17:00:59 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/psutil/setup.py) egg_info for package psutil 17:00:59 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 17:00:59 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 17:00:59 INFO - Installing collected packages: psutil 17:00:59 INFO - Running setup.py install for psutil 17:00:59 INFO - building 'psutil._psutil_linux' extension 17:00:59 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 17:00:59 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 17:00:59 INFO - building 'psutil._psutil_posix' extension 17:00:59 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 17:00:59 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 17:00:59 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 17:00:59 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 17:00:59 INFO - Successfully installed psutil 17:00:59 INFO - Cleaning up... 17:01:00 INFO - Return code: 0 17:01:00 INFO - Installing mozsystemmonitor==0.0.0 into virtualenv /builds/slave/test-pgo/build/venv 17:01:00 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')]} 17:01:00 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 17:01:00 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:01:00 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')]} 17:01:00 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 17:01:00 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:01:00 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 0x7f592ff9cf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x142d8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x14f98d0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x15888b0>, '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 0x15897b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1589c60>, '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': '00204705a9daa57ed339a427000001b9-1458258052.594903-820213356', '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 17:01:00 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 17:01:00 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 17:01:00 INFO - Using env: {'DISPLAY': ':0', 17:01:00 INFO - 'HOME': '/home/cltbld', 17:01:00 INFO - 'LANG': 'en_US.UTF-8', 17:01:00 INFO - 'LANGUAGE': 'en_US:en', 17:01:00 INFO - 'LOGNAME': 'cltbld', 17:01:00 INFO - 'MAIL': '/var/mail/cltbld', 17:01:00 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 17:01:00 INFO - 'MOZ_NO_REMOTE': '1', 17:01:00 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 17:01:00 INFO - 'NO_EM_RESTART': '1', 17:01:00 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 17:01:00 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 17:01:00 INFO - 'PWD': '/builds/slave/test-pgo', 17:01:00 INFO - 'SHELL': '/bin/bash', 17:01:00 INFO - 'SHLVL': '1', 17:01:00 INFO - 'TERM': 'linux', 17:01:00 INFO - 'TMOUT': '86400', 17:01:00 INFO - 'USER': 'cltbld', 17:01:00 INFO - 'XDG_SESSION_COOKIE': '00204705a9daa57ed339a427000001b9-1458258052.594903-820213356', 17:01:00 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 17:01:00 INFO - '_': '/tools/buildbot/bin/python'} 17:01:00 INFO - Ignoring indexes: https://pypi.python.org/simple/ 17:01:00 INFO - Downloading/unpacking mozsystemmonitor==0.0.0 17:01:00 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 17:01:00 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 17:01:00 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 17:01:00 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 17:01:00 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 17:01:00 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 17:01:02 INFO - Downloading mozsystemmonitor-0.0.tar.gz 17:01:02 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 17:01:02 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=0.7.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.0.0) 17:01:02 INFO - Installing collected packages: mozsystemmonitor 17:01:02 INFO - Running setup.py install for mozsystemmonitor 17:01:02 INFO - Successfully installed mozsystemmonitor 17:01:02 INFO - Cleaning up... 17:01:02 INFO - Return code: 0 17:01:02 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test-pgo/build/venv 17:01: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')]} 17:01:02 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 17:01:02 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:01: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')]} 17:01:02 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 17:01:02 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:01: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', '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 0x7f592ff9cf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x142d8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x14f98d0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x15888b0>, '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 0x15897b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1589c60>, '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': '00204705a9daa57ed339a427000001b9-1458258052.594903-820213356', '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 17:01: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', 'blobuploader==1.2.4'] in /builds/slave/test-pgo/build 17:01: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 blobuploader==1.2.4 17:01:02 INFO - Using env: {'DISPLAY': ':0', 17:01:02 INFO - 'HOME': '/home/cltbld', 17:01:02 INFO - 'LANG': 'en_US.UTF-8', 17:01:02 INFO - 'LANGUAGE': 'en_US:en', 17:01:02 INFO - 'LOGNAME': 'cltbld', 17:01:02 INFO - 'MAIL': '/var/mail/cltbld', 17:01:02 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 17:01:02 INFO - 'MOZ_NO_REMOTE': '1', 17:01:02 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 17:01:02 INFO - 'NO_EM_RESTART': '1', 17:01:02 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 17:01:02 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 17:01:02 INFO - 'PWD': '/builds/slave/test-pgo', 17:01:02 INFO - 'SHELL': '/bin/bash', 17:01:02 INFO - 'SHLVL': '1', 17:01:02 INFO - 'TERM': 'linux', 17:01:02 INFO - 'TMOUT': '86400', 17:01:02 INFO - 'USER': 'cltbld', 17:01:02 INFO - 'XDG_SESSION_COOKIE': '00204705a9daa57ed339a427000001b9-1458258052.594903-820213356', 17:01:02 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 17:01:02 INFO - '_': '/tools/buildbot/bin/python'} 17:01:02 INFO - Ignoring indexes: https://pypi.python.org/simple/ 17:01:02 INFO - Downloading/unpacking blobuploader==1.2.4 17:01: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 17:01: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 17:01: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 17:01: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 17:01: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 17:01: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 17:01:04 INFO - Downloading blobuploader-1.2.4.tar.gz 17:01:04 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 17:01:04 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 17:01: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 17:01: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 17:01: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 17:01: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 17:01: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 17:01: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 17:01:04 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/requests/setup.py) egg_info for package requests 17:01:04 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 17:01: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 17:01: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 17:01: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 17:01: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 17:01: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 17:01: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 17:01:05 INFO - Downloading docopt-0.6.1.tar.gz 17:01:05 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/docopt/setup.py) egg_info for package docopt 17:01:05 INFO - Installing collected packages: blobuploader, requests, docopt 17:01:05 INFO - Running setup.py install for blobuploader 17:01:05 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 17:01:05 INFO - changing mode of /builds/slave/test-pgo/build/venv/bin/blobberc.py to 775 17:01:05 INFO - Running setup.py install for requests 17:01:05 INFO - Running setup.py install for docopt 17:01:05 INFO - Successfully installed blobuploader requests docopt 17:01:05 INFO - Cleaning up... 17:01:05 INFO - Return code: 0 17:01:05 INFO - Installing None into virtualenv /builds/slave/test-pgo/build/venv 17:01:05 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 17:01:05 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 17:01:05 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:01:05 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 17:01:05 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 17:01:05 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:01:05 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 0x7f592ff9cf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x142d8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x14f98d0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x15888b0>, '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 0x15897b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1589c60>, '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': '00204705a9daa57ed339a427000001b9-1458258052.594903-820213356', '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 17:01:05 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 17:01:05 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 17:01:05 INFO - Using env: {'DISPLAY': ':0', 17:01:05 INFO - 'HOME': '/home/cltbld', 17:01:05 INFO - 'LANG': 'en_US.UTF-8', 17:01:05 INFO - 'LANGUAGE': 'en_US:en', 17:01:05 INFO - 'LOGNAME': 'cltbld', 17:01:05 INFO - 'MAIL': '/var/mail/cltbld', 17:01:05 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 17:01:05 INFO - 'MOZ_NO_REMOTE': '1', 17:01:05 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 17:01:05 INFO - 'NO_EM_RESTART': '1', 17:01:05 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 17:01:05 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 17:01:05 INFO - 'PWD': '/builds/slave/test-pgo', 17:01:05 INFO - 'SHELL': '/bin/bash', 17:01:05 INFO - 'SHLVL': '1', 17:01:05 INFO - 'TERM': 'linux', 17:01:05 INFO - 'TMOUT': '86400', 17:01:05 INFO - 'USER': 'cltbld', 17:01:05 INFO - 'XDG_SESSION_COOKIE': '00204705a9daa57ed339a427000001b9-1458258052.594903-820213356', 17:01:05 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 17:01:05 INFO - '_': '/tools/buildbot/bin/python'} 17:01:05 INFO - Ignoring indexes: https://pypi.python.org/simple/ 17:01:05 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/manifestparser 17:01:05 INFO - Running setup.py (path:/tmp/pip-TcU5ON-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/manifestparser 17:01:05 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozcrash 17:01:05 INFO - Running setup.py (path:/tmp/pip-1narZi-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozcrash 17:01:06 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdebug 17:01:06 INFO - Running setup.py (path:/tmp/pip-1aJGvy-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdebug 17:01:06 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdevice 17:01:06 INFO - Running setup.py (path:/tmp/pip-VQ94Tj-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdevice 17:01:06 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozfile 17:01:06 INFO - Running setup.py (path:/tmp/pip-eseb8y-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozfile 17:01:06 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozhttpd 17:01:06 INFO - Running setup.py (path:/tmp/pip-6QEkcy-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozhttpd 17:01:06 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinfo 17:01:06 INFO - Running setup.py (path:/tmp/pip-zeXvuZ-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinfo 17:01:06 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinstall 17:01:06 INFO - Running setup.py (path:/tmp/pip-BhconP-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinstall 17:01:06 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozleak 17:01:06 INFO - Running setup.py (path:/tmp/pip-ztFhMF-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozleak 17:01:06 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozlog 17:01:06 INFO - Running setup.py (path:/tmp/pip-8WqWww-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozlog 17:01:06 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moznetwork 17:01:06 INFO - Running setup.py (path:/tmp/pip-MK0xnk-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moznetwork 17:01:06 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprocess 17:01:06 INFO - Running setup.py (path:/tmp/pip-ZKm0Ce-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprocess 17:01:06 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprofile 17:01:06 INFO - Running setup.py (path:/tmp/pip-YIxTX_-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprofile 17:01:06 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozrunner 17:01:06 INFO - Running setup.py (path:/tmp/pip-uI96JN-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozrunner 17:01:06 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 17:01:06 INFO - Running setup.py (path:/tmp/pip-ETZmv2-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 17:01:07 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moztest 17:01:07 INFO - Running setup.py (path:/tmp/pip-8jSX4n-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moztest 17:01:07 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozversion 17:01:07 INFO - Running setup.py (path:/tmp/pip-odh3ar-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozversion 17:01:07 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 17:01:07 INFO - Running setup.py install for manifestparser 17:01:07 INFO - Installing manifestparser script to /builds/slave/test-pgo/build/venv/bin 17:01:07 INFO - Running setup.py install for mozcrash 17:01:07 INFO - Running setup.py install for mozdebug 17:01:07 INFO - Running setup.py install for mozdevice 17:01:07 INFO - Installing sutini script to /builds/slave/test-pgo/build/venv/bin 17:01:07 INFO - Installing dm script to /builds/slave/test-pgo/build/venv/bin 17:01:07 INFO - Running setup.py install for mozfile 17:01:07 INFO - Running setup.py install for mozhttpd 17:01:07 INFO - Installing mozhttpd script to /builds/slave/test-pgo/build/venv/bin 17:01:07 INFO - Running setup.py install for mozinfo 17:01:07 INFO - Installing mozinfo script to /builds/slave/test-pgo/build/venv/bin 17:01:07 INFO - Running setup.py install for mozInstall 17:01:07 INFO - Installing moz_remove_from_system script to /builds/slave/test-pgo/build/venv/bin 17:01:07 INFO - Installing mozuninstall script to /builds/slave/test-pgo/build/venv/bin 17:01:07 INFO - Installing mozinstall script to /builds/slave/test-pgo/build/venv/bin 17:01:07 INFO - Installing moz_add_to_system script to /builds/slave/test-pgo/build/venv/bin 17:01:07 INFO - Running setup.py install for mozleak 17:01:08 INFO - Running setup.py install for mozlog 17:01:08 INFO - Installing structlog script to /builds/slave/test-pgo/build/venv/bin 17:01:08 INFO - Running setup.py install for moznetwork 17:01:08 INFO - Installing moznetwork script to /builds/slave/test-pgo/build/venv/bin 17:01:08 INFO - Running setup.py install for mozprocess 17:01:08 INFO - Running setup.py install for mozprofile 17:01:08 INFO - Installing mozprofile script to /builds/slave/test-pgo/build/venv/bin 17:01:08 INFO - Installing diff-profiles script to /builds/slave/test-pgo/build/venv/bin 17:01:08 INFO - Installing view-profile script to /builds/slave/test-pgo/build/venv/bin 17:01:08 INFO - Running setup.py install for mozrunner 17:01:08 INFO - Installing mozrunner script to /builds/slave/test-pgo/build/venv/bin 17:01:08 INFO - Running setup.py install for mozscreenshot 17:01:08 INFO - Running setup.py install for moztest 17:01:08 INFO - Running setup.py install for mozversion 17:01:08 INFO - Installing mozversion script to /builds/slave/test-pgo/build/venv/bin 17:01:08 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 17:01:08 INFO - Cleaning up... 17:01:08 INFO - Return code: 0 17:01:08 INFO - Installing None into virtualenv /builds/slave/test-pgo/build/venv 17:01:08 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 17:01:08 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 17:01:08 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:01:08 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 17:01:08 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 17:01:08 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:01:08 INFO - retry: Calling run_command with args: [['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test-pgo/build/tests/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 0x7f592ff9cf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x142d8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x14f98d0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x15888b0>, '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 0x15897b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1589c60>, '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': '00204705a9daa57ed339a427000001b9-1458258052.594903-820213356', '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 17:01:08 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 17:01:08 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 17:01:08 INFO - Using env: {'DISPLAY': ':0', 17:01:08 INFO - 'HOME': '/home/cltbld', 17:01:08 INFO - 'LANG': 'en_US.UTF-8', 17:01:08 INFO - 'LANGUAGE': 'en_US:en', 17:01:08 INFO - 'LOGNAME': 'cltbld', 17:01:08 INFO - 'MAIL': '/var/mail/cltbld', 17:01:08 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 17:01:08 INFO - 'MOZ_NO_REMOTE': '1', 17:01:08 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 17:01:08 INFO - 'NO_EM_RESTART': '1', 17:01:08 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 17:01:08 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 17:01:08 INFO - 'PWD': '/builds/slave/test-pgo', 17:01:08 INFO - 'SHELL': '/bin/bash', 17:01:08 INFO - 'SHLVL': '1', 17:01:08 INFO - 'TERM': 'linux', 17:01:08 INFO - 'TMOUT': '86400', 17:01:08 INFO - 'USER': 'cltbld', 17:01:08 INFO - 'XDG_SESSION_COOKIE': '00204705a9daa57ed339a427000001b9-1458258052.594903-820213356', 17:01:08 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 17:01:08 INFO - '_': '/tools/buildbot/bin/python'} 17:01:09 INFO - Ignoring indexes: https://pypi.python.org/simple/ 17:01:09 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/manifestparser 17:01:09 INFO - Running setup.py (path:/tmp/pip-uxPvfl-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/manifestparser 17:01:09 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)) 17:01:09 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozcrash 17:01:09 INFO - Running setup.py (path:/tmp/pip-QhxA8T-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozcrash 17:01:09 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash==0.17 from file:///builds/slave/test-pgo/build/tests/mozbase/mozcrash in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 2)) 17:01:09 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdebug 17:01:09 INFO - Running setup.py (path:/tmp/pip-UUurst-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdebug 17:01:09 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)) 17:01:09 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdevice 17:01:09 INFO - Running setup.py (path:/tmp/pip-wZGV7Q-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdevice 17:01:09 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)) 17:01:09 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozfile 17:01:09 INFO - Running setup.py (path:/tmp/pip-pf979C-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozfile 17:01:09 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)) 17:01:09 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozhttpd 17:01:09 INFO - Running setup.py (path:/tmp/pip-pelk4v-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozhttpd 17:01:09 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)) 17:01:09 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinfo 17:01:09 INFO - Running setup.py (path:/tmp/pip-cPb36p-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinfo 17:01:09 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)) 17:01:09 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinstall 17:01:09 INFO - Running setup.py (path:/tmp/pip-Jcv1Pa-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinstall 17:01:09 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)) 17:01:09 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozleak 17:01:09 INFO - Running setup.py (path:/tmp/pip-yidQ4R-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozleak 17:01:09 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)) 17:01:09 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozlog 17:01:09 INFO - Running setup.py (path:/tmp/pip-2oXhZC-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozlog 17:01:09 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)) 17:01:09 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moznetwork 17:01:09 INFO - Running setup.py (path:/tmp/pip-8DUAVM-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moznetwork 17:01:09 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)) 17:01:09 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprocess 17:01:09 INFO - Running setup.py (path:/tmp/pip-OTdXid-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprocess 17:01:10 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)) 17:01:10 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprofile 17:01:10 INFO - Running setup.py (path:/tmp/pip-R5HFHi-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprofile 17:01:10 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)) 17:01:10 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozrunner 17:01:10 INFO - Running setup.py (path:/tmp/pip-AcHb1j-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozrunner 17:01:10 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)) 17:01:10 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 17:01:10 INFO - Running setup.py (path:/tmp/pip-kWiRdc-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 17:01:10 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)) 17:01:10 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moztest 17:01:10 INFO - Running setup.py (path:/tmp/pip-lBf7CF-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moztest 17:01:10 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)) 17:01:10 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozversion 17:01:10 INFO - Running setup.py (path:/tmp/pip-zCuqnh-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozversion 17:01:10 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)) 17:01:10 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.0 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from mozcrash==0.17->-r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 2)) 17:01:10 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.0 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from mozcrash==0.17->-r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 2)) 17:01:10 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)) 17:01:10 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)) 17:01:10 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)) 17:01:10 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.1->-r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 10)) 17:01:10 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 17:01:10 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 17:01:10 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 17:01:10 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 17:01:10 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 17:01:10 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 17:01:12 INFO - Downloading blessings-1.6.tar.gz 17:01:12 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/blessings/setup.py) egg_info for package blessings 17:01:12 INFO - Installing collected packages: blessings 17:01:12 INFO - Running setup.py install for blessings 17:01:12 INFO - Successfully installed blessings 17:01:12 INFO - Cleaning up... 17:01:12 INFO - Return code: 0 17:01:12 INFO - Done creating virtualenv /builds/slave/test-pgo/build/venv. 17:01:12 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'freeze'] 17:01:12 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip freeze 17:01:12 INFO - Reading from file tmpfile_stdout 17:01:12 INFO - Current package versions: 17:01:12 INFO - argparse == 1.2.1 17:01:12 INFO - blessings == 1.6 17:01:12 INFO - blobuploader == 1.2.4 17:01:12 INFO - docopt == 0.6.1 17:01:12 INFO - manifestparser == 1.1 17:01:12 INFO - mozInstall == 1.12 17:01:12 INFO - mozcrash == 0.17 17:01:12 INFO - mozdebug == 0.1 17:01:12 INFO - mozdevice == 0.48 17:01:12 INFO - mozfile == 1.2 17:01:12 INFO - mozhttpd == 0.7 17:01:12 INFO - mozinfo == 0.9 17:01:12 INFO - mozleak == 0.1 17:01:12 INFO - mozlog == 3.1 17:01:12 INFO - moznetwork == 0.27 17:01:12 INFO - mozprocess == 0.22 17:01:12 INFO - mozprofile == 0.28 17:01:12 INFO - mozrunner == 6.11 17:01:12 INFO - mozscreenshot == 0.1 17:01:12 INFO - mozsystemmonitor == 0.0 17:01:12 INFO - moztest == 0.7 17:01:12 INFO - mozversion == 1.4 17:01:12 INFO - psutil == 3.1.1 17:01:12 INFO - requests == 1.2.3 17:01:12 INFO - wsgiref == 0.1.2 17:01:12 INFO - Installing None into virtualenv /builds/slave/test-pgo/build/venv 17:01:12 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')]} 17:01:12 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 17:01:12 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:01:12 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')]} 17:01:12 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 17:01:12 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:01:12 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 0x7f592ff9cf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x142d8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x14f98d0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x15888b0>, '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 0x15897b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1589c60>, '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': '00204705a9daa57ed339a427000001b9-1458258052.594903-820213356', '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 17:01:12 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 17:01:12 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 17:01:12 INFO - Using env: {'DISPLAY': ':0', 17:01:12 INFO - 'HOME': '/home/cltbld', 17:01:12 INFO - 'LANG': 'en_US.UTF-8', 17:01:12 INFO - 'LANGUAGE': 'en_US:en', 17:01:12 INFO - 'LOGNAME': 'cltbld', 17:01:12 INFO - 'MAIL': '/var/mail/cltbld', 17:01:12 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 17:01:12 INFO - 'MOZ_NO_REMOTE': '1', 17:01:12 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 17:01:12 INFO - 'NO_EM_RESTART': '1', 17:01:12 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 17:01:12 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 17:01:12 INFO - 'PWD': '/builds/slave/test-pgo', 17:01:12 INFO - 'SHELL': '/bin/bash', 17:01:12 INFO - 'SHLVL': '1', 17:01:12 INFO - 'TERM': 'linux', 17:01:12 INFO - 'TMOUT': '86400', 17:01:12 INFO - 'USER': 'cltbld', 17:01:12 INFO - 'XDG_SESSION_COOKIE': '00204705a9daa57ed339a427000001b9-1458258052.594903-820213356', 17:01:12 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 17:01:12 INFO - '_': '/tools/buildbot/bin/python'} 17:01:12 INFO - Ignoring indexes: https://pypi.python.org/simple/ 17:01:12 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)) 17:01:12 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)) 17:01:12 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)) 17:01:12 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)) 17:01:12 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)) 17:01:12 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)) 17:01:12 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)) 17:01:12 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)) 17:01:12 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)) 17:01:12 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)) 17:01:12 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)) 17:01:12 INFO - Cleaning up... 17:01:12 INFO - Return code: 0 17:01:12 INFO - Installing jsonschema into virtualenv /builds/slave/test-pgo/build/venv 17:01:12 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')]} 17:01:12 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 17:01:12 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:01:12 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')]} 17:01:12 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 17:01:12 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:01:12 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 0x7f592ff9cf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x142d8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x14f98d0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x15888b0>, '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 0x15897b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1589c60>, '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': '00204705a9daa57ed339a427000001b9-1458258052.594903-820213356', '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 17:01:12 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 17:01:12 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 17:01:12 INFO - Using env: {'DISPLAY': ':0', 17:01:12 INFO - 'HOME': '/home/cltbld', 17:01:12 INFO - 'LANG': 'en_US.UTF-8', 17:01:12 INFO - 'LANGUAGE': 'en_US:en', 17:01:12 INFO - 'LOGNAME': 'cltbld', 17:01:12 INFO - 'MAIL': '/var/mail/cltbld', 17:01:12 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 17:01:12 INFO - 'MOZ_NO_REMOTE': '1', 17:01:12 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 17:01:12 INFO - 'NO_EM_RESTART': '1', 17:01:12 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 17:01:12 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 17:01:12 INFO - 'PWD': '/builds/slave/test-pgo', 17:01:12 INFO - 'SHELL': '/bin/bash', 17:01:12 INFO - 'SHLVL': '1', 17:01:12 INFO - 'TERM': 'linux', 17:01:12 INFO - 'TMOUT': '86400', 17:01:12 INFO - 'USER': 'cltbld', 17:01:12 INFO - 'XDG_SESSION_COOKIE': '00204705a9daa57ed339a427000001b9-1458258052.594903-820213356', 17:01:12 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 17:01:12 INFO - '_': '/tools/buildbot/bin/python'} 17:01:13 INFO - Ignoring indexes: https://pypi.python.org/simple/ 17:01:13 INFO - Downloading/unpacking jsonschema 17:01:13 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 17:01:13 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 17:01:13 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 17:01:13 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 17:01:13 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 17:01:13 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 17:01:15 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 17:01:15 INFO - Downloading/unpacking functools32 (from jsonschema) 17:01:15 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 17:01:15 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 17:01:15 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 17:01:15 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 17:01:15 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 17:01:15 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 17:01:15 INFO - Downloading functools32-3.2.3-2.tar.gz 17:01:15 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/functools32/setup.py) egg_info for package functools32 17:01:15 INFO - warning: no files found matching '*.txt' 17:01:15 INFO - no previously-included directories found matching 'build' 17:01:15 INFO - no previously-included directories found matching 'dist' 17:01:15 INFO - no previously-included directories found matching '.git*' 17:01:15 INFO - Installing collected packages: jsonschema, functools32 17:01:15 INFO - Running setup.py install for functools32 17:01:15 INFO - warning: no files found matching '*.txt' 17:01:15 INFO - no previously-included directories found matching 'build' 17:01:15 INFO - no previously-included directories found matching 'dist' 17:01:15 INFO - no previously-included directories found matching '.git*' 17:01:15 INFO - Successfully installed jsonschema functools32 17:01:15 INFO - Cleaning up... 17:01:15 INFO - Return code: 0 17:01:15 INFO - Installing flake8 into virtualenv /builds/slave/test-pgo/build/venv 17:01:15 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')]} 17:01:15 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 17:01:15 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:01:15 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')]} 17:01:15 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 17:01:15 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:01:15 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 0x7f592ff9cf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x142d8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x14f98d0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x15888b0>, '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 0x15897b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1589c60>, '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': '00204705a9daa57ed339a427000001b9-1458258052.594903-820213356', '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 17:01:15 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 17:01:15 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 17:01:15 INFO - Using env: {'DISPLAY': ':0', 17:01:15 INFO - 'HOME': '/home/cltbld', 17:01:15 INFO - 'LANG': 'en_US.UTF-8', 17:01:15 INFO - 'LANGUAGE': 'en_US:en', 17:01:15 INFO - 'LOGNAME': 'cltbld', 17:01:15 INFO - 'MAIL': '/var/mail/cltbld', 17:01:15 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 17:01:15 INFO - 'MOZ_NO_REMOTE': '1', 17:01:15 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 17:01:15 INFO - 'NO_EM_RESTART': '1', 17:01:15 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 17:01:15 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 17:01:15 INFO - 'PWD': '/builds/slave/test-pgo', 17:01:15 INFO - 'SHELL': '/bin/bash', 17:01:15 INFO - 'SHLVL': '1', 17:01:15 INFO - 'TERM': 'linux', 17:01:15 INFO - 'TMOUT': '86400', 17:01:15 INFO - 'USER': 'cltbld', 17:01:15 INFO - 'XDG_SESSION_COOKIE': '00204705a9daa57ed339a427000001b9-1458258052.594903-820213356', 17:01:15 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 17:01:15 INFO - '_': '/tools/buildbot/bin/python'} 17:01:15 INFO - Ignoring indexes: https://pypi.python.org/simple/ 17:01:15 INFO - Downloading/unpacking flake8 17:01:15 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 17:01:15 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 17:01:15 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 17:01:15 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 17:01:15 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 17:01:15 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 17:01:17 INFO - Downloading flake8-2.5.0-py2.py3-none-any.whl 17:01:17 INFO - Downloading/unpacking mccabe>=0.2.1,<0.4 (from flake8) 17:01:17 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 17:01:17 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 17:01:17 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 17:01:17 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 17:01:17 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 17:01:17 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 17:01:17 INFO - Downloading mccabe-0.3.1-py2.py3-none-any.whl 17:01:17 INFO - Downloading/unpacking pyflakes>=0.8.1,<1.1 (from flake8) 17:01:17 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 17:01:17 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 17:01:17 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 17:01:17 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 17:01:17 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 17:01:17 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 17:01:17 INFO - Downloading/unpacking pep8>=1.5.7,!=1.6.0,!=1.6.1,!=1.6.2 (from flake8) 17:01:17 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 17:01:17 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 17:01:17 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 17:01:17 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 17:01:17 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 17:01:17 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 17:01:18 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/pep8/setup.py) egg_info for package pep8 17:01:18 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 17:01:18 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 17:01:18 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 17:01:18 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 17:01:18 INFO - no previously-included directories found matching 'docs/_build' 17:01:18 INFO - Installing collected packages: flake8, mccabe, pyflakes, pep8 17:01:18 INFO - Running setup.py install for pep8 17:01:18 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 17:01:18 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 17:01:18 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 17:01:18 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 17:01:18 INFO - no previously-included directories found matching 'docs/_build' 17:01:18 INFO - Installing pep8 script to /builds/slave/test-pgo/build/venv/bin 17:01:18 INFO - Successfully installed flake8 mccabe pyflakes pep8 17:01:18 INFO - Cleaning up... 17:01:18 INFO - Return code: 0 17:01:18 INFO - Running post-action listener: _resource_record_post_action 17:01:18 INFO - Running post-action listener: _start_resource_monitoring 17:01:18 INFO - Starting resource monitoring. 17:01:18 INFO - ##### 17:01:18 INFO - ##### Running install step. 17:01:18 INFO - ##### 17:01:18 INFO - Running pre-action listener: _resource_record_pre_action 17:01:18 INFO - Running main action method: install 17:01:18 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'freeze'] 17:01:18 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip freeze 17:01:18 INFO - Reading from file tmpfile_stdout 17:01:18 INFO - Detecting whether we're running mozinstall >=1.0... 17:01:18 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/mozinstall', '-h'] 17:01:18 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/mozinstall -h 17:01:18 INFO - Reading from file tmpfile_stdout 17:01:18 INFO - Output received: 17:01:18 INFO - Usage: mozinstall [options] installer 17:01:18 INFO - Options: 17:01:18 INFO - -h, --help show this help message and exit 17:01:18 INFO - -d DEST, --destination=DEST 17:01:18 INFO - Directory to install application into. [default: 17:01:18 INFO - "/builds/slave/test-pgo"] 17:01:18 INFO - --app=APP Application being installed. [default: firefox] 17:01:18 INFO - mkdir: /builds/slave/test-pgo/build/application 17:01:18 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/mozinstall', '/builds/slave/test-pgo/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2', '--destination', '/builds/slave/test-pgo/build/application'] 17:01:18 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/mozinstall /builds/slave/test-pgo/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2 --destination /builds/slave/test-pgo/build/application 17:01:35 INFO - Reading from file tmpfile_stdout 17:01:35 INFO - Output received: 17:01:35 INFO - /builds/slave/test-pgo/build/application/firefox/firefox 17:01:35 INFO - Running post-action listener: _resource_record_post_action 17:01:35 INFO - ##### 17:01:35 INFO - ##### Running run-tests step. 17:01:35 INFO - ##### 17:01:35 INFO - Running pre-action listener: _resource_record_pre_action 17:01:35 INFO - Running main action method: run_tests 17:01:35 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/python', '--version'] 17:01:35 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/python --version 17:01:35 INFO - Python 2.7.3 17:01:35 INFO - Return code: 0 17:01:35 INFO - grabbing minidump binary from tooltool 17:01: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')]} 17:01:35 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 0x15888b0>, '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 0x15897b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1589c60>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test-pgo/build', 'privileged': False}, attempt #1 17:01:35 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 17:01:35 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 17:01:35 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 17:01:35 INFO - Return code: 0 17:01:35 INFO - Chmoding /builds/slave/test-pgo/build/linux64-minidump_stackwalk to 0755 17:01:35 INFO - mkdir: /builds/slave/test-pgo/build/blobber_upload_dir 17:01:35 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test-pgo/build/blobber_upload_dir 17:01:35 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test-pgo/build/linux64-minidump_stackwalk 17:01:35 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test-pgo/build/blobber_upload_dir 17:01:35 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/flake8', '/builds/slave/test-pgo/build/tests/talos/talos'] 17:01:35 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/flake8 /builds/slave/test-pgo/build/tests/talos/talos 17:01:36 INFO - Return code: 0 17:01:36 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/python', '/builds/slave/test-pgo/build/tests/talos/talos/run_tests.py', '--branchName', 'Fx-Team', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test-pgo/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/OFRwGw3xRmOVFero6ljGbQ/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-016', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log', '--log-raw=/builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs-e10s_raw.log'] in /builds/slave/test-pgo/build 17:01:36 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/python /builds/slave/test-pgo/build/tests/talos/talos/run_tests.py --branchName Fx-Team --suite dromaeojs-e10s --executablePath /builds/slave/test-pgo/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/OFRwGw3xRmOVFero6ljGbQ/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-016 --webServer localhost --log-tbpl-level=debug --log-errorsummary=/builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log --log-raw=/builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs-e10s_raw.log 17:01:36 INFO - Using env: {'DISPLAY': ':0', 17:01:36 INFO - 'HOME': '/home/cltbld', 17:01:36 INFO - 'LANG': 'en_US.UTF-8', 17:01:36 INFO - 'LANGUAGE': 'en_US:en', 17:01:36 INFO - 'LOGNAME': 'cltbld', 17:01:36 INFO - 'MAIL': '/var/mail/cltbld', 17:01:36 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test-pgo/build/blobber_upload_dir', 17:01:36 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test-pgo/build/linux64-minidump_stackwalk', 17:01:36 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 17:01:36 INFO - 'MOZ_NO_REMOTE': '1', 17:01:36 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test-pgo/build/blobber_upload_dir', 17:01:36 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 17:01:36 INFO - 'NO_EM_RESTART': '1', 17:01:36 INFO - 'PATH': '/builds/slave/test-pgo/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 17:01:36 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 17:01:36 INFO - 'PWD': '/builds/slave/test-pgo', 17:01:36 INFO - 'PYTHONPATH': '/builds/slave/test-pgo/build/tests/talos', 17:01:36 INFO - 'SHELL': '/bin/bash', 17:01:36 INFO - 'SHLVL': '1', 17:01:36 INFO - 'TERM': 'linux', 17:01:36 INFO - 'TMOUT': '86400', 17:01:36 INFO - 'USER': 'cltbld', 17:01:36 INFO - 'XDG_SESSION_COOKIE': '00204705a9daa57ed339a427000001b9-1458258052.594903-820213356', 17:01:36 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 17:01:36 INFO - '_': '/tools/buildbot/bin/python'} 17:01:36 INFO - Calling ['/builds/slave/test-pgo/build/venv/bin/python', '/builds/slave/test-pgo/build/tests/talos/talos/run_tests.py', '--branchName', 'Fx-Team', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test-pgo/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/OFRwGw3xRmOVFero6ljGbQ/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-016', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log', '--log-raw=/builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs-e10s_raw.log'] with output_timeout 3600 17:01:36 INFO - mozversion application_buildid: 20160317143606 17:01:36 INFO - mozversion application_changeset: 1477dcbfb8ec44166c93473932a475a3c4dec17f 17:01:36 INFO - mozversion application_display_name: Nightly 17:01:36 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 17:01:36 INFO - mozversion application_name: Firefox 17:01:36 INFO - mozversion application_remotingname: firefox 17:01:36 INFO - mozversion application_repository: https://hg.mozilla.org/integration/fx-team 17:01:36 INFO - mozversion application_vendor: Mozilla 17:01:36 INFO - mozversion application_version: 48.0a1 17:01:36 INFO - mozversion platform_buildid: 20160317143606 17:01:36 INFO - mozversion platform_changeset: 1477dcbfb8ec44166c93473932a475a3c4dec17f 17:01:36 INFO - mozversion platform_repository: https://hg.mozilla.org/integration/fx-team 17:01:36 INFO - mozversion platform_version: 48.0a1 17:01:36 INFO - using testdate: 1458259296 17:01:36 INFO - actual date: 1458259296 17:01:36 INFO - starting webserver on 'localhost:42535' 17:01:36 INFO - SUITE-START | Running 2 tests 17:01:36 INFO - TEST-START | dromaeo_css 17:01:36 INFO - operating with platform_type : linux_ 17:01:36 INFO - Initialising browser for dromaeo_css test... 17:01:36 INFO - TEST-INFO | started process 22265 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpza7CqM/profile http://localhost:42535/getInfo.html) 17:01:40 INFO - PROCESS | 22265 | 17:01:40 INFO - PROCESS | 22265 | (process:22346): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 17:01:40 INFO - PROCESS | 22265 | JavaScript error: jar:file:///builds/slave/test-pgo/build/application/firefox/omni.ja!/components/Weave.js, line 13: NS_ERROR_NOT_AVAILABLE: Component returned failure code: 0x80040111 (NS_ERROR_NOT_AVAILABLE) [nsIXPCComponents_Utils.import] 17:01:41 INFO - PROCESS | 22265 | __metrics Screen width/height:1600/1200 17:01:41 INFO - PROCESS | 22265 | colorDepth:24 17:01:41 INFO - PROCESS | 22265 | Browser inner width/height: 1024/697 17:01:41 INFO - PROCESS | 22265 | __metrics 17:01:41 ERROR - PROCESS | 22265 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 2864: TypeError: this.tabs is undefined 17:01:42 INFO - TEST-INFO | 22265: exit 0 17:01:42 INFO - Browser initialized. 17:01:42 INFO - Running cycle 1/1 for dromaeo_css test... 17:01:42 INFO - TEST-INFO | started process 22398 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpza7CqM/profile -tp file:/builds/slave/test-pgo/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 17:01:44 INFO - PROCESS | 22398 | 17:01:44 INFO - PROCESS | 22398 | (process:22459): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 17:01:54 INFO - PROCESS | 22398 | RSS: Main: 165240832 17:01:54 INFO - PROCESS | 22398 | 17:02:43 INFO - PROCESS | 22398 | 1458259363866 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] 17:04:51 INFO - PROCESS | 22398 | Cycle 1(1): loaded http://localhost:42535/tests/dromaeo/cssquery-dojo.html (next: http://localhost:42535/tests/dromaeo/cssquery-ext.html) 17:04:52 INFO - PROCESS | 22398 | RSS: Main: 169889792 17:04:52 INFO - PROCESS | 22398 | 17:07:54 INFO - PROCESS | 22398 | Cycle 1(1): loaded http://localhost:42535/tests/dromaeo/cssquery-ext.html (next: http://localhost:42535/tests/dromaeo/cssquery-jquery.html) 17:07:55 INFO - PROCESS | 22398 | RSS: Main: 169304064 17:07:55 INFO - PROCESS | 22398 | 17:10:56 INFO - PROCESS | 22398 | Cycle 1(1): loaded http://localhost:42535/tests/dromaeo/cssquery-jquery.html (next: http://localhost:42535/tests/dromaeo/cssquery-mootools.html) 17:10:57 INFO - PROCESS | 22398 | RSS: Main: 169762816 17:10:57 INFO - PROCESS | 22398 | 17:13:59 INFO - PROCESS | 22398 | Cycle 1(1): loaded http://localhost:42535/tests/dromaeo/cssquery-mootools.html (next: http://localhost:42535/tests/dromaeo/cssquery-prototype.html) 17:13:59 INFO - PROCESS | 22398 | RSS: Main: 167424000 17:13:59 INFO - PROCESS | 22398 | 17:17:02 INFO - PROCESS | 22398 | Cycle 1(1): loaded http://localhost:42535/tests/dromaeo/cssquery-prototype.html (next: http://localhost:42535/tests/dromaeo/cssquery-yui.html) 17:17:02 INFO - PROCESS | 22398 | RSS: Main: 167575552 17:17:02 INFO - PROCESS | 22398 | 17:20:05 INFO - PROCESS | 22398 | Cycle 1(1): loaded http://localhost:42535/tests/dromaeo/cssquery-yui.html (next: http://localhost:42535/tests/dromaeo/cssquery-dojo.html) 17:20:05 INFO - PROCESS | 22398 | RSS: Main: 171356160 17:20:05 INFO - PROCESS | 22398 | 17:20:05 INFO - PROCESS | 22398 | __start_tp_report 17:20:05 INFO - PROCESS | 22398 | _x_x_mozilla_page_load 17:20:05 INFO - PROCESS | 22398 | _x_x_mozilla_page_load_details 17:20:05 INFO - PROCESS | 22398 | |i|pagename|runs| 17:20:05 INFO - PROCESS | 22398 | |0;dojo.html;3119.9532007019898;3129.953050704239;3158.510430883211;3181.6182058153026;3187.059817353882;5347.144456886899;5382.085045542258;5410.91883621746;5443.564514838813;5452.91820622691;5269.841904742854;5357.571394288458;5410.702411367373;5492.066348720717;5493.835184944448;4876.634252431073;4897.853064408056;4955.653104282702;5027.321311622921;5119.488051194888;4918.336024636682;4923.212286034235;4959;4965.528274813887;4976.925346119811;4787.97058632394;4881.853544393656;4923.606111511071;4949.158643030657;4983.028309479653;4885.340479035321;4894.143524883167;4904.779284932187;4914.877128071791;4929.408470983469;4840.467548569654;4877.487863774288;4890.095332363524;4894.583960363338;4901.852944411673;5344.5724342052545;5389.461053894618;5427.050266203399;5440.374356948962;5473.425290344536;5756.7985120521;5765.682887441189;5766.596338256324;5766.625169363978;5767.5962682612235;5582.246396736429;5783.826485205451;5799.565032622528;5803.303603567557;5846.123081537761;5430.809921652763;5436.3476382834315;5436.401995780461;5451.890962180734;5485.6434331768705;5909.202257695242;5941.049432090845;5946.791862284886;5948.791792287336;5952.791652292149;5595.356533998561;5673.8297851064535;5679.77280908759;5707;5769.769209231667;5734.2258795062135;5743.167240750068;5744.684042377626;5747.913781293284;5807.303123625107;5612.214289999403;5640.351359593699;5649.265595472562;5676.914846277309;5694.288213973254;5623.718814059363;5719;5732.971335143381;5744.396838331915;5776.624519406225;4319.503257125408;4377.4528183977;4384.013596940663;4390.121975604892;4400.867973960786;3885.339492286318;3906.43356713275;3917.177392747555;3936.9606303936594;3938.330483817758;5546.473085056913;5547;5548.833534993957;5573.6098473106495;5574.944250557523;5663.80176693822;5755.251817263729;5759.136129580513;5829.271341082364;5887.381824908323;5462.7268636568015;5499.202615620793;5501.367342755554;5508.779648814083;5542.224088627595;4978.5270399312;4984.77568509418;5002.674826136362;5024.547790698854;5049.394072711299;5980.491658209101;5993.400659933972;6018.488428483628;6032.819015429544;6042.305134909454;5741.0527263002805;5834.795782147605;5836.4747172753805;5857.941420585739;5912.852178695567;6059.394060593905;6060.333363329942;6069.33237343883;6085.66528840918;6104.4505994460715;5645.06856368711;5695.943040569541;5735.627184233178;5743.97128014374;5759.366469688414;5640;5755.913661295001;5791.8552036199435;5835.912461313169;5837.737301821343;5663.603547751618;5678.488935995781;5691.459311365414;5693.11756677699;5693.857653558694;5552.639078459887;5648.5481161507805;5649.802256920988;5660.830175094754;5673.744681489426;5493.697846618475;5506.201600767786;5506.311711036121;5513.448655134454;5551.333839939233;5544.473275038865;5586.273784408164;5610.382857885547;5618.438156184349;5629.211910332475;5488.4785945335125;5521.723913804374;5533.253010843485;5542.224088627515;5580.9441905580425 17:20:05 INFO - PROCESS | 22398 | |1;ext.html;570.6975303089363;580.6748220996241;587.556394921834;599.0624672387715;606.5663050918589;36750.26499470009;36807.26385472289;36867.63132368676;37422.25155496892;37654.62345376545;38038.23923521528;38080.80959595198;38109.61890381095;38400.231995360075;38497.61502384975;8402.243798058189;8550.059493455716;8560.315174786003;8561.914380856175;8563.186497282779;8411.32709383251;8623.95688021559;8676.783080423009;8739.694110706127;8746.125387461267;8628.784280392978;8743.081976392483;8747.562621868912;8748.562571871413;8762.693305734301;8702.086280940504;8727.563621818916;8763.56182190888;8766.60550275239;8779.561021948877;8616.913830861673;8735.563221838882;8749.47503149813;8760.912390876074;8783.780405489913;36763.63236367629;36957;36997.26005479902;37069.25861482782;37251;3001;3317.20387107095;3368.831558422069;3371.174062354739;3691.4093745000673;28200.576991345148;28285.717142828515;30729.231769205726;31088;31097.378052438824;4272.551382104865;4312.266914624522;4316.266234740102;4324.740515569076;4326.545712700184;211423;212760;213242;213825;214224.99999999843;55820.16269755957;55907.44092559022;56047.43952560422;56370.718146409825;56719.432805671415;59954;60175.69912150411;66323.33676663172;67367;67581.32418675849;14084.436622534984;14187;14219.64450888736;14325.713485730226;14332.856671433361;10827.891721082688;10840.186985976083;10853.186011049203;10883.619073332395;10889.945550272356;19779.50551236202;20044;20064;20127.899360503397;20390.796092039185;7788.337991270805;8131.79670508242;8180.304674102649;8274.503529788231;8320.16798320163;1035.5961175141701;1087.2986923434341;1115.6820306212853;1125.3754166437543;1129.9774004519863;31553;31693.52459713106;32031.51952720711;32390.676093238766;32560.348793024008;1096.4517741129434;1138.686861113184;1152.7924973504682;1187.5843454790754;1244.4275633208645;16027.439039633557;16027.679446411006;16203.432879849384;16426.260818263207;16464.176791160393;383025;384615;386120;387424;387742;54362.45637543653;54961.725191374586;55314.72342638342;55352;56538.71730641321;1324.7946568281932;1334.5195729537359;1344.200200880494;1351.6418149190276;1358.9864101359058;30351.544726829557;30355.173394683163;30827.383452331276;31530;31587.36825263528;47790;48322.758386207846;48425.757871210415;48610;48624;342632;352976;353177;353326;354425;37085.25829483449;37113.62886371102;37340.813295933345;37447.25105497929;37739.43390849084;47733;48008.75995620139;48440.5155948436;48788.512114878395;49078.5092149074;39897.40153897636;40492.19015619612;41018.79490602528;41173.588264116974;41779.7911010443;39188.80405597954;40835.59164408318;40980.79509602433;41462.79268603637;41842.372364413946;37563.68527101538;40001.79999099986;40321.59678403178;41006.1798764029;41563;31394.68605314009;32382.35235295328;33674.49488257629;34935.47596786101;34959.65040349564;26729.732702672725;27267.454650907268;27338.45323093567;27344.453110938066;27388.46539917902 17:20:05 INFO - PROCESS | 22398 | |2;jquery.html;354.5302474221657;361.82813163747215;362.45450596851737;364.9215418684982;367.783008025265;17153.313867445304;17826.82173178268;19522.31671891484;19625.31311404101;19692.90153549234;18226.27094916205;18730;18947.147378367972;18952.526186845334;18961.62076758464;5502.58730595205;5772.769089236425;5797.681127537984;5805.10020946754;5806.622569532967;5656.745446454919;6624.436922861562;6897.586144831301;6902.965485172567;6915.585064896097;6641.302663220365;6838.316168383171;6861.931380686204;6874.518783685144;6929.3070692930805;6944.4444444444325;6959.547629404073;6982.301769823002;7003;7033.788986330418;6610.537262391635;6688.699008544579;6701.698423570951;6715.563488373289;6870.553414028072;23749;24152.879235603887;24548;25103.497930041478;25305;2488.8880000399845;2496.9750302496923;2499.1003238834005;2556.475922435915;2974.925626859346;14993.550193494213;15291;15834.604134896605;16099.114548699818;16226.43207487744;2150.709654196695;2182.639864422368;2259.4464356232666;2284.2589289253538;2404.314770290459;81309;83762.58118709429;85546.14453855506;86575;87525.12474875234;17854.91072544629;17913.10434478271;18011.639767204582;18112.547186320448;18112.818871811112;27385.31536711598;27436;27499.587506187425;27757.918156137966;27969.72030279712;8411.411201215979;8540.188682075193;8587.828243435097;8697.391182617283;8788.91211087881;7008.264132266038;7095.787126386217;7116.857662846817;7224.0608720867;7245.311695388929;8486.151384861465;8492.363072769567;8678.088800675838;8714.346424018224;8758.737237882873;1828.743975843383;1860.3209828412532;1883.8681292309407;1886.9528261793564;1902.6289873474539;900.4147304252289;956.7799406136628;959.491469521155;981.4454833019321;1006.8540061691014;17993.55016124581;18210.54473638143;18920.891528099753;18925.337613183474;19192.46460283174;978.3885071830106;1002.6791426743372;1012.6961911426542;1022.6829682798357;1069.417167643636;10357.74105647365;10782.78434431307;10822.40476773785;10847.51186196623;10918.1811364148;500667;508967;515814;526484;530539;80751;81955.59022204851;82362.58818705867;84069.15930840613;84190.57904710437;1007.6725064354114;1007.7480629842539;1014.4217795856439;1041.630221271453;1075.1184029096223;16632.168391580613;16759.664806703553;16768.077755723552;16827;16927.915360423613;36089.63910360863;36340.45489317715;37133.62866371302;37181.44227836639;37361;42367.788161059;44385.11229775322;45139.097218056115;48185;54222;8114.959425202836;8330.666773329;8348;8355.206255405727;8454.83090338202;12358;12932.15940963872;13133.73732525325;13162.802557961446;13276.203427794364;11165.441727913734;11439.256448330832;11471.139664525028;11488.425578721197;11623.535058597561;11221.887781122085;11380.146489013192;11452.198346115692;11561.537538498365;11571.768564628492;11467.770644586895;11686.94156529212;11803.940980295043;11816.82274765862;11876.287422754662;8086.83826323482;8152.959235203786;8228.547429891174;8276.503409795432;8469.280111190617;10530.262881598215;11297.15271354668;11356.94321528387;11543.653690389301;11589.594364197214 17:20:05 INFO - PROCESS | 22398 | |3;mootools.html;1435.425829668133;1452.5279284232624;1575.9212039398028;1710.3586155191804;1715.391036182156;7736.110347310054;7739.767806965786;7854.7250846220395;7968.521888686676;7999.640016199271;7915.762527124196;7972.481788683732;7992.680292788282;8012.479188852721;8074.071481779597;2352.1179557665873;2359.5634807560655;2379.7739214774656;2384.3800611840875;2387.4270175157926;2273.6703178039174;2280.8745518996448;2291.1522736587485;2303.516261585069;2309.261036468331;2271.205078222625;2273.27255278311;2293.5986202414592;2312.7340355859124;2314.3404129823;2330.8135349172026;2339.8245131615113;2346.2726554767905;2359.775821296974;2360.492494113765;2344.5779759643256;2352.3295860679623;2363.2319496163814;2363.83453158279;2364.6571247169236;7996.880436738861;8008.199180082003;8014.639341229658;8032.39757018226;8067.757967260992;4989.675671081368;5098.923516147261;5119.334486516766;5129.846104616868;5142;3196.616406031268;3221.5650887130173;3301.6698330167033;3321.8339083045994;3368.59576850777;1023.7235946294459;1025.077430312717;1061.7398737309409;1080.7247448011344;1082.99458502707;10918.617848375348;10936.890631093667;11048.171387145996;11081.556737730481;11108.055815255713;4233.1956928183545;4263.722858014281;4331.960329520893;4337.436133302651;4365.650747940157;8785.648574057093;8790.208881200722;8807;8823.161799629024;8857.11428857109;4900.897298107897;4919.532644398848;4956.008798240367;4966.205407134841;4972.726500042532;3895.980520097438;4461.018575913294;4470.083632855257;4488.39406680094;4591.678582499259;3494.3186078714916;3547.255076433926;3570.071781336871;3582.802945837952;3583.7849729016343;1109.4674556213063;1112.7496313329598;1127.0363838917608;1128.700894263021;1139.680889350983;1152.3604399558326;1165.854268216473;1278.0989402471234;1334.5195729537359;1398.8321401431892;7485.887711684329;7485.925140748632;7489.063867016623;7602.1257555380735;7670.578118203553;469.31011413222507;474.58948009971124;477.18163349855166;481.31653052665297;484.1817328714461;5826;5891.96890544153;5893.882122357529;5897.498712609477;5923.674197919069;9357.157855793012;9900.108990190918;9938.453385063747;10029.097381235579;10058.798824023625;9739.366941148803;9743.415395076318;9775.608975640895;9781.510924453749;9807.558659860324;7392.55644661322;7500.587467689329;7556.282153195438;7577.128630207597;7594.924050759532;7413.925860741324;7467.215942325977;7470.0662417197855;7492.063492063492;7537.359324457263;8598.140185981352;8727.345449091217;8737.951445826542;8740;8903.510306932922;8139.104698483044;8945.955270223607;8948.552572371485;9045.412048216846;9083.227925626396;6154;6901.24086350491;7114.181869085121;7122.465815063994;7267.418606511572;7629.046369203849;7666.118396384487;7683.654235559525;7687.308142267223;7774.961125194338;6718.6976586054725;6925.653717314013;6996.300369962963;6998.545094568837;7048.259932707197;6828.453723702191;6898.172219333712;6936.306369363225;7010.719571217094;7103.041089453064;6846.212685541027;7002.159740831133;7037.648117593997;7328.96335518319;7414.8887766682465;6526.216853977553;6566.409023187936;6624.105745724266;6625.867482650417;6628.867422651617;6459.61242325462;6525.902111468236;6571.80284591463;6573.40839324444;6590.8352291193105 17:20:05 INFO - PROCESS | 22398 | |4;prototype.html;327.04013719732586;330.1136448635414;330.2437418312064;333.59468246081013;333.7730343366513;6307.590006649571;6346.587471814335;6422.775202867906;6429.678516074201;6463.644499552523;6337.524685648584;6353.587016843902;6373.872522549546;6377.744890204398;6386.968065159679;4548.772561371935;4633.86098417048;4779.80880764769;4845.53967373099;4849.321095046696;4791.329213910055;4836.153673107192;4836.540528649773;4839.5644392004715;4867.977724677822;4790.473047964721;4796.328514008042;4798.7840547175465;4799.256115302133;4805.927911081337;4799.016201678665;4804.543568361018;4815.638827087965;4816.951830481686;4820.276958456225;4201.663866890642;4202.243596152692;4204.369344598304;4210.094829611618;4212.831486740527;5925.940740592582;6081.878362432771;6120.816375508697;6147.385261473862;6157.96921015392;5539.224508568804;5570.832875013756;5625.071863142576;5639.436056394369;5667.744951477193;6711.194656641185;6721.932780672229;6733.898991515082;6735.7642482513365;6737.19153701554;4633.073385322915;4660.091282199973;4682.157211701892;4694.953050469486;4703.482616912137;7000.159980802286;7015.684294206773;7035.4019908307855;7075.469339799587;7089.72384970705;4764.052964767815;4791.233402655628;4827.782749776268;4838.637102217348;4845.3216549683075;4839.225723884161;4880.731559764176;4887.902241955141;4889.48660390661;4895.192293271642;5595.38450770415;5600.551955843523;5618.831435056954;5635.971820140955;5639.915401268984;6755.088063111417;6757.121574195323;6766.18805743314;6783.559068660521;6807.523473356818;1705.0792572011223;1705.914704264782;1716.0218675355177;1716.7339062445342;1720.5870591058306;1118.8042092633757;1143.4682872464343;1149.781541507111;1158.988410115905;1175.7413369058793;6530.8040758777315;6553.541252112402;6581.80254592363;6601.075849381091;6610.9669451652435;6900.171979362408;6975.476839236976;6994;7015.508914375945;7031.753888613874;6682.532222744361;6715.127033485714;6718.32816718334;6719.395254427027;6720.361565651256;3785.1294202333065;3826.6364695353896;3829.2341531693774;3831.8658846940225;3837.175007373428;7365.889511657329;7394.223606521346;7394.260573942563;7407.111146662435;7417.664820332392;7002.404795592432;7206.387457066103;7245.130584329914;7257.818554536178;7264.818379540554;7176.677049532888;7193.856122877513;7199.424046076301;7208.35124838767;7234.385077268491;6938.653067346511;6959.61722105289;6962.338577835098;7021.438284937295;7070.151581810215;6925.342092501204;6984.231734509099;6993.160820701345;7001.194862590663;7007.229204787572;7147.749828755968;7299.708011679473;7340.376068034063;7347.926520734724;7373.262673732584;4610.054938737484;4623.69945953512;4651.813927443;4654.2785868190485;4656;6891.793246202622;6987.755428559976;7015.263397343206;7044.049053377728;7044.577325360495;6785.796426107225;6813.182418109858;6822.249552549315;6828.317168283132;6849.349311815369;6652.268250492345;6818.488613353919;6825.55633883796;6826.317368263332;6832.8725760249;6696.129503164558;6717.664116794239;6728.9813056082;6743.730250789913;6775.559588626724;6779.35596118368;6829.863402732017;6836.589804611739;6836.726530938906;6875.89686154698;6608.570442921195;6653.767118150841;6677.966610166918;6692.933070669231;6697.899531507129 17:20:05 INFO - PROCESS | 22398 | |5;yui.html;777.8755399136138;785.2147852147853;785.2203200669629;795.0538858758081;802.5626033811573;14450.277486125691;14601.196934168616;14614.780778288308;14664.560063198094;14674.339654715537;13749.518766843163;13761.931190344034;13788.103773254732;13803.585892423218;13863.930680346584;654.4241067860277;815.388458656008;816.8325493273894;817.9182081791818;820.8645573480369;801.7434420985287;804.3042768005691;810.2221867007651;810.8621534339177;824.7690646618956;857.9828403431927;858.995705021474;859.5616235719765;862.2670729879615;874.3136637739376;852.9019162796264;857.391252210931;860.5095095795399;860.9913900860973;864.6843901975797;640.3692363022419;641.8138739765462;642.6658137768381;643.2538255623455;643.768243432364;14357.210353430557;14388.64028399288;14420.711585768226;14449.494267700686;14530.491432799907;14253.857461425358;14455.927720361437;14505.492307769284;14508.202048887308;14518.346674399678;11175.497102630401;11327.773444531063;11336.43317834105;11579.189456738031;11746.412679365998;3767.7174211934216;3768.434734789776;3808.409696497047;3817.6373244541724;3889;55460;55919;55988;56370.71814640942;56422.43577564213;10970.835437468444;11254.718632034264;11293.265937714023;11499.367534785668;11527.654170374903;20808.47978800542;21114;21118.577628447347;21142;21149.68275475869;8293.626786794608;8314.251717345467;8336.208060234268;8363.790905227297;8367.8326433471;4666.813327466931;4747.098051370229;4793.257045157937;4818.71087734737;4869.878253043702;3007.2782532192555;3029.5455681647927;3033.4691428999836;3036.6052413186144;3040.331127152023;548.1914176589498;560.2828379674024;562.7214528808184;572.7794799002331;575.4705670782889;646.5118835279334;670.7417644207015;698.3191388396375;724.5978481942573;732.578767208857;9318.627254909728;9354.812903741888;9528.475933823567;9661.420314781135;9825.919148893616;599.5443462968176;719.2483854372089;728.1407938632465;743.1676522295064;759.8632246195627;4317.414134972746;4362.672799540047;4384.714993525411;4401.955980440154;4467.7319360838455;65229.34770652233;67543;67554.32445675578;67749.66125169343;68062;50676.239856402186;57022.71488642613;57269.42730572641;58670.7066464665;59110.40889591049;49344.50655493471;51026.489735102914;52610;52721.73639131856;53946.999999999214;10016.499175041074;10076.899231007596;10143.492825358555;10220.131288840532;10261.58953641846;38119;38849.2230155401;39635;39994.60005400025;40478.190436190525;46922.29616555686;50744.74627626838;50993.74503127461;51266.74366628143;51349.74325128351;12233.938830306148;12330.383480825743;12337.876621233672;12520.186187897758;12606.432710527864;13662.590122296348;13910.443582257001;14421.495247666282;14720.926395367955;15181.165035922688;12927.806082908575;12986.480540778262;13361.13152645075;13377.464901403835;13586.252756098509;13022.153560018569;13212.933935330262;13219.801702974655;13228;13709.17744935307;12256.14207005501;12574.93712531468;12872.356382180666;13124.27816470065;13704.588862334145;10424.739381515523;10555.736106597089;10765;10792.460376980962;11230.494627741607;10538.315009524356;10630.149588033093;10680.83978740335;10892.074173695324;10906.890931090906 17:20:05 INFO - PROCESS | 22398 | __end_tp_report 17:20:05 INFO - PROCESS | 22398 | __start_cc_report 17:20:05 INFO - PROCESS | 22398 | _x_x_mozilla_cycle_collect,336 17:20:05 INFO - PROCESS | 22398 | __end_cc_report 17:20:05 INFO - PROCESS | 22398 | __startTimestamp1458260405260__endTimestamp 17:20:05 INFO - PROCESS | 22398 | 17:20:05 INFO - PROCESS | 22398 | ------- Summary: start ------- 17:20:05 INFO - PROCESS | 22398 | Number of tests: 6 17:20:05 INFO - PROCESS | 22398 | 17:20:05 INFO - PROCESS | 22398 | [#0] dojo.html Cycles:165 Average:5371.16 Median:5551.33 stddev:610.01 (11.0%) stddev-sans-first:585.76 17:20:05 INFO - PROCESS | 22398 | Values: 3120.0 3130.0 3158.5 3181.6 3187.1 5347.1 5382.1 5410.9 5443.6 5452.9 5269.8 5357.6 5410.7 5492.1 5493.8 4876.6 4897.9 4955.7 5027.3 5119.5 4918.3 4923.2 4959.0 4965.5 4976.9 4788.0 4881.9 4923.6 4949.2 4983.0 4885.3 4894.1 4904.8 4914.9 4929.4 4840.5 4877.5 4890.1 4894.6 4901.9 5344.6 5389.5 5427.1 5440.4 5473.4 5756.8 5765.7 5766.6 5766.6 5767.6 5582.2 5783.8 5799.6 5803.3 5846.1 5430.8 5436.3 5436.4 5451.9 5485.6 5909.2 5941.0 5946.8 5948.8 5952.8 5595.4 5673.8 5679.8 5707.0 5769.8 5734.2 5743.2 5744.7 5747.9 5807.3 5612.2 5640.4 5649.3 5676.9 5694.3 5623.7 5719.0 5733.0 5744.4 5776.6 4319.5 4377.5 4384.0 4390.1 4400.9 3885.3 3906.4 3917.2 3937.0 3938.3 5546.5 5547.0 5548.8 5573.6 5574.9 5663.8 5755.3 5759.1 5829.3 5887.4 5462.7 5499.2 5501.4 5508.8 5542.2 4978.5 4984.8 5002.7 5024.5 5049.4 5980.5 5993.4 6018.5 6032.8 6042.3 5741.1 5834.8 5836.5 5857.9 5912.9 6059.4 6060.3 6069.3 6085.7 6104.5 5645.1 5695.9 5735.6 5744.0 5759.4 5640.0 5755.9 5791.9 5835.9 5837.7 5663.6 5678.5 5691.5 5693.1 5693.9 5552.6 5648.5 5649.8 5660.8 5673.7 5493.7 5506.2 5506.3 5513.4 5551.3 5544.5 5586.3 5610.4 5618.4 5629.2 5488.5 5521.7 5533.3 5542.2 5580.9 17:20:05 INFO - PROCESS | 22398 | 17:20:05 INFO - PROCESS | 22398 | [#1] ext.html Cycles:180 Average:49236.64 Median:37888.84 stddev:85581.49 (225.9%) stddev-sans-first:85743.56 17:20:05 INFO - PROCESS | 22398 | Values: 570.7 580.7 587.6 599.1 606.6 36750.3 36807.3 36867.6 37422.3 37654.6 38038.2 38080.8 38109.6 38400.2 38497.6 8402.2 8550.1 8560.3 8561.9 8563.2 8411.3 8624.0 8676.8 8739.7 8746.1 8628.8 8743.1 8747.6 8748.6 8762.7 8702.1 8727.6 8763.6 8766.6 8779.6 8616.9 8735.6 8749.5 8760.9 8783.8 36763.6 36957.0 36997.3 37069.3 37251.0 3001.0 3317.2 3368.8 3371.2 3691.4 28200.6 28285.7 30729.2 31088.0 31097.4 4272.6 4312.3 4316.3 4324.7 4326.5 211423.0 212760.0 213242.0 213825.0 214225.0 55820.2 55907.4 56047.4 56370.7 56719.4 59954.0 60175.7 66323.3 67367.0 67581.3 14084.4 14187.0 14219.6 14325.7 14332.9 10827.9 10840.2 10853.2 10883.6 10889.9 19779.5 20044.0 20064.0 20127.9 20390.8 7788.3 8131.8 8180.3 8274.5 8320.2 1035.6 1087.3 1115.7 1125.4 1130.0 31553.0 31693.5 32031.5 32390.7 32560.3 1096.5 1138.7 1152.8 1187.6 1244.4 16027.4 16027.7 16203.4 16426.3 16464.2 383025.0 384615.0 386120.0 387424.0 387742.0 54362.5 54961.7 55314.7 55352.0 56538.7 1324.8 1334.5 1344.2 1351.6 1359.0 30351.5 30355.2 30827.4 31530.0 31587.4 47790.0 48322.8 48425.8 48610.0 48624.0 342632.0 352976.0 353177.0 353326.0 354425.0 37085.3 37113.6 37340.8 37447.3 37739.4 47733.0 48008.8 48440.5 48788.5 49078.5 39897.4 40492.2 41018.8 41173.6 41779.8 39188.8 40835.6 40980.8 41462.8 41842.4 37563.7 40001.8 40321.6 41006.2 41563.0 31394.7 32382.4 33674.5 34935.5 34959.7 26729.7 27267.5 27338.5 27344.5 27388.5 17:20:05 INFO - PROCESS | 22398 | 17:20:05 INFO - PROCESS | 22398 | [#2] jquery.html Cycles:180 Average:30002.90 Median:27467.79 stddev:84688.07 (308.3%) stddev-sans-first:84896.39 17:20:05 INFO - PROCESS | 22398 | Values: 354.5 361.8 362.5 364.9 367.8 17153.3 17826.8 19522.3 19625.3 19692.9 18226.3 18730.0 18947.1 18952.5 18961.6 5502.6 5772.8 5797.7 5805.1 5806.6 5656.7 6624.4 6897.6 6903.0 6915.6 6641.3 6838.3 6861.9 6874.5 6929.3 6944.4 6959.5 6982.3 7003.0 7033.8 6610.5 6688.7 6701.7 6715.6 6870.6 23749.0 24152.9 24548.0 25103.5 25305.0 2488.9 2497.0 2499.1 2556.5 2974.9 14993.6 15291.0 15834.6 16099.1 16226.4 2150.7 2182.6 2259.4 2284.3 2404.3 81309.0 83762.6 85546.1 86575.0 87525.1 17854.9 17913.1 18011.6 18112.5 18112.8 27385.3 27436.0 27499.6 27757.9 27969.7 8411.4 8540.2 8587.8 8697.4 8788.9 7008.3 7095.8 7116.9 7224.1 7245.3 8486.2 8492.4 8678.1 8714.3 8758.7 1828.7 1860.3 1883.9 1887.0 1902.6 900.4 956.8 959.5 981.4 1006.9 17993.6 18210.5 18920.9 18925.3 19192.5 978.4 1002.7 1012.7 1022.7 1069.4 10357.7 10782.8 10822.4 10847.5 10918.2 500667.0 508967.0 515814.0 526484.0 530539.0 80751.0 81955.6 82362.6 84069.2 84190.6 1007.7 1007.7 1014.4 1041.6 1075.1 16632.2 16759.7 16768.1 16827.0 16927.9 36089.6 36340.5 37133.6 37181.4 37361.0 42367.8 44385.1 45139.1 48185.0 54222.0 8115.0 8330.7 8348.0 8355.2 8454.8 12358.0 12932.2 13133.7 13162.8 13276.2 11165.4 11439.3 11471.1 11488.4 11623.5 11221.9 11380.1 11452.2 11561.5 11571.8 11467.8 11686.9 11803.9 11816.8 11876.3 8086.8 8153.0 8228.5 8276.5 8469.3 10530.3 11297.2 11356.9 11543.7 11589.6 17:20:05 INFO - PROCESS | 22398 | 17:20:05 INFO - PROCESS | 22398 | [#3] mootools.html Cycles:180 Average:5578.51 Median:5910.59 stddev:2925.80 (49.5%) stddev-sans-first:2917.43 17:20:05 INFO - PROCESS | 22398 | Values: 1435.4 1452.5 1575.9 1710.4 1715.4 7736.1 7739.8 7854.7 7968.5 7999.6 7915.8 7972.5 7992.7 8012.5 8074.1 2352.1 2359.6 2379.8 2384.4 2387.4 2273.7 2280.9 2291.2 2303.5 2309.3 2271.2 2273.3 2293.6 2312.7 2314.3 2330.8 2339.8 2346.3 2359.8 2360.5 2344.6 2352.3 2363.2 2363.8 2364.7 7996.9 8008.2 8014.6 8032.4 8067.8 4989.7 5098.9 5119.3 5129.8 5142.0 3196.6 3221.6 3301.7 3321.8 3368.6 1023.7 1025.1 1061.7 1080.7 1083.0 10918.6 10936.9 11048.2 11081.6 11108.1 4233.2 4263.7 4332.0 4337.4 4365.7 8785.6 8790.2 8807.0 8823.2 8857.1 4900.9 4919.5 4956.0 4966.2 4972.7 3896.0 4461.0 4470.1 4488.4 4591.7 3494.3 3547.3 3570.1 3582.8 3583.8 1109.5 1112.7 1127.0 1128.7 1139.7 1152.4 1165.9 1278.1 1334.5 1398.8 7485.9 7485.9 7489.1 7602.1 7670.6 469.3 474.6 477.2 481.3 484.2 5826.0 5892.0 5893.9 5897.5 5923.7 9357.2 9900.1 9938.5 10029.1 10058.8 9739.4 9743.4 9775.6 9781.5 9807.6 7392.6 7500.6 7556.3 7577.1 7594.9 7413.9 7467.2 7470.1 7492.1 7537.4 8598.1 8727.3 8738.0 8740.0 8903.5 8139.1 8946.0 8948.6 9045.4 9083.2 6154.0 6901.2 7114.2 7122.5 7267.4 7629.0 7666.1 7683.7 7687.3 7775.0 6718.7 6925.7 6996.3 6998.5 7048.3 6828.5 6898.2 6936.3 7010.7 7103.0 6846.2 7002.2 7037.6 7329.0 7414.9 6526.2 6566.4 6624.1 6625.9 6628.9 6459.6 6525.9 6571.8 6573.4 6590.8 17:20:05 INFO - PROCESS | 22398 | 17:20:05 INFO - PROCESS | 22398 | [#4] prototype.html Cycles:180 Average:5672.15 Median:6542.17 stddev:1731.64 (26.5%) stddev-sans-first:1689.39 17:20:05 INFO - PROCESS | 22398 | Values: 327.0 330.1 330.2 333.6 333.8 6307.6 6346.6 6422.8 6429.7 6463.6 6337.5 6353.6 6373.9 6377.7 6387.0 4548.8 4633.9 4779.8 4845.5 4849.3 4791.3 4836.2 4836.5 4839.6 4868.0 4790.5 4796.3 4798.8 4799.3 4805.9 4799.0 4804.5 4815.6 4817.0 4820.3 4201.7 4202.2 4204.4 4210.1 4212.8 5925.9 6081.9 6120.8 6147.4 6158.0 5539.2 5570.8 5625.1 5639.4 5667.7 6711.2 6721.9 6733.9 6735.8 6737.2 4633.1 4660.1 4682.2 4695.0 4703.5 7000.2 7015.7 7035.4 7075.5 7089.7 4764.1 4791.2 4827.8 4838.6 4845.3 4839.2 4880.7 4887.9 4889.5 4895.2 5595.4 5600.6 5618.8 5636.0 5639.9 6755.1 6757.1 6766.2 6783.6 6807.5 1705.1 1705.9 1716.0 1716.7 1720.6 1118.8 1143.5 1149.8 1159.0 1175.7 6530.8 6553.5 6581.8 6601.1 6611.0 6900.2 6975.5 6994.0 7015.5 7031.8 6682.5 6715.1 6718.3 6719.4 6720.4 3785.1 3826.6 3829.2 3831.9 3837.2 7365.9 7394.2 7394.3 7407.1 7417.7 7002.4 7206.4 7245.1 7257.8 7264.8 7176.7 7193.9 7199.4 7208.4 7234.4 6938.7 6959.6 6962.3 7021.4 7070.2 6925.3 6984.2 6993.2 7001.2 7007.2 7147.7 7299.7 7340.4 7347.9 7373.3 4610.1 4623.7 4651.8 4654.3 4656.0 6891.8 6987.8 7015.3 7044.0 7044.6 6785.8 6813.2 6822.2 6828.3 6849.3 6652.3 6818.5 6825.6 6826.3 6832.9 6696.1 6717.7 6729.0 6743.7 6775.6 6779.4 6829.9 6836.6 6836.7 6875.9 6608.6 6653.8 6678.0 6692.9 6697.9 17:20:05 INFO - PROCESS | 22398 | 17:20:05 INFO - PROCESS | 22398 | [#5] yui.html Cycles:180 Average:15581.45 Median:4340.04 stddev:18214.34 (419.7%) stddev-sans-first:18231.52 17:20:05 INFO - PROCESS | 22398 | Values: 777.9 785.2 785.2 795.1 802.6 14450.3 14601.2 14614.8 14664.6 14674.3 13749.5 13761.9 13788.1 13803.6 13863.9 654.4 815.4 816.8 817.9 820.9 801.7 804.3 810.2 810.9 824.8 858.0 859.0 859.6 862.3 874.3 852.9 857.4 860.5 861.0 864.7 640.4 641.8 642.7 643.3 643.8 14357.2 14388.6 14420.7 14449.5 14530.5 14253.9 14455.9 14505.5 14508.2 14518.3 11175.5 11327.8 11336.4 11579.2 11746.4 3767.7 3768.4 3808.4 3817.6 3889.0 55460.0 55919.0 55988.0 56370.7 56422.4 10970.8 11254.7 11293.3 11499.4 11527.7 20808.5 21114.0 21118.6 21142.0 21149.7 8293.6 8314.3 8336.2 8363.8 8367.8 4666.8 4747.1 4793.3 4818.7 4869.9 3007.3 3029.5 3033.5 3036.6 3040.3 548.2 560.3 562.7 572.8 575.5 646.5 670.7 698.3 724.6 732.6 9318.6 9354.8 9528.5 9661.4 9825.9 599.5 719.2 728.1 743.2 759.9 4317.4 4362.7 4384.7 4402.0 4467.7 65229.3 67543.0 67554.3 67749.7 68062.0 50676.2 57022.7 57269.4 58670.7 59110.4 49344.5 51026.5 52610.0 52721.7 53947.0 10016.5 10076.9 10143.5 10220.1 10261.6 38119.0 38849.2 39635.0 39994.6 40478.2 46922.3 50744.7 50993.7 51266.7 51349.7 12233.9 12330.4 12337.9 12520.2 12606.4 13662.6 13910.4 14421.5 14720.9 15181.2 12927.8 12986.5 13361.1 13377.5 13586.3 13022.2 13212.9 13219.8 13228.0 13709.2 12256.1 12574.9 12872.4 13124.3 13704.6 10424.7 10555.7 10765.0 10792.5 11230.5 10538.3 10630.1 10680.8 10892.1 10906.9 17:20:05 INFO - PROCESS | 22398 | -------- Summary: end -------- 17:20:05 INFO - PROCESS | 22398 | 17:20:05 INFO - TEST-INFO | 22398: exit 0 17:20:05 INFO - TEST-OK | dromaeo_css | took 1109400ms 17:20:05 INFO - TEST-START | kraken 17:20:05 INFO - operating with platform_type : linux_ 17:20:05 INFO - Initialising browser for kraken test... 17:20:05 INFO - TEST-INFO | started process 22637 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmp8N6PSY/profile http://localhost:42535/getInfo.html) 17:20:09 INFO - PROCESS | 22637 | 17:20:09 INFO - PROCESS | 22637 | (process:22706): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 17:20:09 INFO - PROCESS | 22637 | JavaScript error: jar:file:///builds/slave/test-pgo/build/application/firefox/omni.ja!/components/Weave.js, line 13: NS_ERROR_NOT_AVAILABLE: Component returned failure code: 0x80040111 (NS_ERROR_NOT_AVAILABLE) [nsIXPCComponents_Utils.import] 17:20:10 INFO - PROCESS | 22637 | __metrics Screen width/height:1600/1200 17:20:10 INFO - PROCESS | 22637 | colorDepth:24 17:20:10 INFO - PROCESS | 22637 | Browser inner width/height: 1024/697 17:20:10 INFO - PROCESS | 22637 | __metrics 17:20:10 ERROR - PROCESS | 22637 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 2864: TypeError: this.tabs is undefined 17:20:11 INFO - TEST-INFO | 22637: exit 0 17:20:11 INFO - Browser initialized. 17:20:11 INFO - Running cycle 1/1 for kraken test... 17:20:11 INFO - TEST-INFO | started process 22758 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmp8N6PSY/profile -tp file:/builds/slave/test-pgo/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 17:20:13 INFO - PROCESS | 22758 | 17:20:13 INFO - PROCESS | 22758 | (process:22818): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 17:20:23 INFO - PROCESS | 22758 | RSS: Main: 165740544 17:20:23 INFO - PROCESS | 22758 | 17:20:26 INFO - PROCESS | 22758 | Cycle 1(1): loaded http://localhost:42535/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:42535/tests/kraken/driver.html?testName=audio-beat-detection) 17:20:26 INFO - PROCESS | 22758 | RSS: Main: 169881600 17:20:26 INFO - PROCESS | 22758 | 17:20:29 INFO - PROCESS | 22758 | Cycle 1(1): loaded http://localhost:42535/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:42535/tests/kraken/driver.html?testName=audio-dft) 17:20:29 INFO - PROCESS | 22758 | RSS: Main: 171159552 17:20:29 INFO - PROCESS | 22758 | 17:20:32 INFO - PROCESS | 22758 | Cycle 1(1): loaded http://localhost:42535/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:42535/tests/kraken/driver.html?testName=audio-fft) 17:20:33 INFO - PROCESS | 22758 | RSS: Main: 167567360 17:20:33 INFO - PROCESS | 22758 | 17:20:35 INFO - PROCESS | 22758 | Cycle 1(1): loaded http://localhost:42535/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:42535/tests/kraken/driver.html?testName=audio-oscillator) 17:20:36 INFO - PROCESS | 22758 | RSS: Main: 168443904 17:20:36 INFO - PROCESS | 22758 | 17:20:38 INFO - PROCESS | 22758 | Cycle 1(1): loaded http://localhost:42535/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:42535/tests/kraken/driver.html?testName=imaging-gaussian-blur) 17:20:38 INFO - PROCESS | 22758 | RSS: Main: 166789120 17:20:38 INFO - PROCESS | 22758 | 17:20:41 INFO - PROCESS | 22758 | Cycle 1(1): loaded http://localhost:42535/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:42535/tests/kraken/driver.html?testName=imaging-darkroom) 17:20:42 INFO - PROCESS | 22758 | RSS: Main: 168792064 17:20:42 INFO - PROCESS | 22758 | 17:20:45 INFO - PROCESS | 22758 | Cycle 1(1): loaded http://localhost:42535/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:42535/tests/kraken/driver.html?testName=imaging-desaturate) 17:20:46 INFO - PROCESS | 22758 | RSS: Main: 169058304 17:20:46 INFO - PROCESS | 22758 | 17:20:49 INFO - PROCESS | 22758 | Cycle 1(1): loaded http://localhost:42535/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:42535/tests/kraken/driver.html?testName=json-parse-financial) 17:20:50 INFO - PROCESS | 22758 | RSS: Main: 170860544 17:20:50 INFO - PROCESS | 22758 | 17:20:51 INFO - PROCESS | 22758 | Cycle 1(1): loaded http://localhost:42535/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:42535/tests/kraken/driver.html?testName=json-stringify-tinderbox) 17:20:52 INFO - PROCESS | 22758 | RSS: Main: 169218048 17:20:52 INFO - PROCESS | 22758 | 17:20:53 INFO - PROCESS | 22758 | Cycle 1(1): loaded http://localhost:42535/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:42535/tests/kraken/driver.html?testName=stanford-crypto-aes) 17:20:54 INFO - PROCESS | 22758 | RSS: Main: 169230336 17:20:54 INFO - PROCESS | 22758 | 17:20:56 INFO - PROCESS | 22758 | Cycle 1(1): loaded http://localhost:42535/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:42535/tests/kraken/driver.html?testName=stanford-crypto-ccm) 17:20:57 INFO - PROCESS | 22758 | RSS: Main: 169996288 17:20:57 INFO - PROCESS | 22758 | 17:20:59 INFO - PROCESS | 22758 | Cycle 1(1): loaded http://localhost:42535/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:42535/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 17:21:00 INFO - PROCESS | 22758 | RSS: Main: 169984000 17:21:00 INFO - PROCESS | 22758 | 17:21:02 INFO - PROCESS | 22758 | Cycle 1(1): loaded http://localhost:42535/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:42535/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 17:21:03 INFO - PROCESS | 22758 | RSS: Main: 169332736 17:21:03 INFO - PROCESS | 22758 | 17:21:04 INFO - PROCESS | 22758 | Cycle 1(1): loaded http://localhost:42535/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:42535/tests/kraken/driver.html?testName=ai-astar) 17:21:05 INFO - PROCESS | 22758 | RSS: Main: 171409408 17:21:05 INFO - PROCESS | 22758 | 17:21:05 INFO - PROCESS | 22758 | __start_tp_report 17:21:05 INFO - PROCESS | 22758 | _x_x_mozilla_page_load 17:21:05 INFO - PROCESS | 22758 | _x_x_mozilla_page_load_details 17:21:05 INFO - PROCESS | 22758 | |i|pagename|runs| 17:21:05 INFO - PROCESS | 22758 | |0;ai-astar;112;108;111;111;113;120;111;110;110;110 17:21:05 INFO - PROCESS | 22758 | |1;audio-beat-detection;156;125;154;164;128;157;155;128;172;127 17:21:05 INFO - PROCESS | 22758 | |2;audio-dft;163;162;162;163;165;162;163;167;169;162 17:21:05 INFO - PROCESS | 22758 | |3;audio-fft;73;72;79;80;75;72;76;76;140;76 17:21:05 INFO - PROCESS | 22758 | |4;audio-oscillator;92;93;146;92;93;94;144;93;93;140 17:21:05 INFO - PROCESS | 22758 | |5;imaging-gaussian-blur;118;117;117;121;117;117;118;117;117;117 17:21:05 INFO - PROCESS | 22758 | |6;imaging-darkroom;146;146;147;147;145;147;147;146;148;146 17:21:05 INFO - PROCESS | 22758 | |7;imaging-desaturate;97;96;96;96;96;96;95;97;96;95 17:21:05 INFO - PROCESS | 22758 | |8;json-parse-financial;57;58;59;55;57;59;56;57;55;55 17:21:05 INFO - PROCESS | 22758 | |9;json-stringify-tinderbox;61;59;59;60;60;60;60;59;59;59 17:21:05 INFO - PROCESS | 22758 | |10;stanford-crypto-aes;78;86;83;79;80;80;79;78;80;80 17:21:05 INFO - PROCESS | 22758 | |11;stanford-crypto-ccm;120;107;108;124;116;111;120;109;111;112 17:21:05 INFO - PROCESS | 22758 | |12;stanford-crypto-pbkdf2;138;138;152;141;138;137;140;141;142;142 17:21:05 INFO - PROCESS | 22758 | |13;stanford-crypto-sha256-iterative;62;64;65;64;64;61;64;66;65;62 17:21:05 INFO - PROCESS | 22758 | __end_tp_report 17:21:05 INFO - PROCESS | 22758 | __start_cc_report 17:21:05 INFO - PROCESS | 22758 | _x_x_mozilla_cycle_collect,781 17:21:05 INFO - PROCESS | 22758 | __end_cc_report 17:21:05 INFO - PROCESS | 22758 | __startTimestamp1458260465148__endTimestamp 17:21:05 INFO - PROCESS | 22758 | 17:21:05 INFO - PROCESS | 22758 | ------- Summary: start ------- 17:21:05 INFO - PROCESS | 22758 | Number of tests: 14 17:21:05 INFO - PROCESS | 22758 | 17:21:05 INFO - PROCESS | 22758 | [#0] ai-astar Cycles:10 Average:111.60 Median:111.00 stddev:3.24 (2.9%) stddev-sans-first:3.43 17:21:05 INFO - PROCESS | 22758 | Values: 112.0 108.0 111.0 111.0 113.0 120.0 111.0 110.0 110.0 110.0 17:21:05 INFO - PROCESS | 22758 | 17:21:05 INFO - PROCESS | 22758 | [#1] audio-beat-detection Cycles:10 Average:146.60 Median:155.50 stddev:17.68 (11.4%) stddev-sans-first:18.42 17:21:05 INFO - PROCESS | 22758 | Values: 156.0 125.0 154.0 164.0 128.0 157.0 155.0 128.0 172.0 127.0 17:21:05 INFO - PROCESS | 22758 | 17:21:05 INFO - PROCESS | 22758 | [#2] audio-dft Cycles:10 Average:163.80 Median:163.00 stddev:2.44 (1.5%) stddev-sans-first:2.57 17:21:05 INFO - PROCESS | 22758 | Values: 163.0 162.0 162.0 163.0 165.0 162.0 163.0 167.0 169.0 162.0 17:21:05 INFO - PROCESS | 22758 | 17:21:05 INFO - PROCESS | 22758 | [#3] audio-fft Cycles:10 Average:81.90 Median:76.00 stddev:20.59 (27.1%) stddev-sans-first:21.58 17:21:05 INFO - PROCESS | 22758 | Values: 73.0 72.0 79.0 80.0 75.0 72.0 76.0 76.0 140.0 76.0 17:21:05 INFO - PROCESS | 22758 | 17:21:05 INFO - PROCESS | 22758 | [#4] audio-oscillator Cycles:10 Average:108.00 Median:93.00 stddev:24.43 (26.3%) stddev-sans-first:25.22 17:21:05 INFO - PROCESS | 22758 | Values: 92.0 93.0 146.0 92.0 93.0 94.0 144.0 93.0 93.0 140.0 17:21:05 INFO - PROCESS | 22758 | 17:21:05 INFO - PROCESS | 22758 | [#5] imaging-gaussian-blur Cycles:10 Average:117.60 Median:117.00 stddev:1.26 (1.1%) stddev-sans-first:1.33 17:21:05 INFO - PROCESS | 22758 | Values: 118.0 117.0 117.0 121.0 117.0 117.0 118.0 117.0 117.0 117.0 17:21:05 INFO - PROCESS | 22758 | 17:21:05 INFO - PROCESS | 22758 | [#6] imaging-darkroom Cycles:10 Average:146.50 Median:147.00 stddev:0.85 (0.6%) stddev-sans-first:0.88 17:21:05 INFO - PROCESS | 22758 | Values: 146.0 146.0 147.0 147.0 145.0 147.0 147.0 146.0 148.0 146.0 17:21:05 INFO - PROCESS | 22758 | 17:21:05 INFO - PROCESS | 22758 | [#7] imaging-desaturate Cycles:10 Average:96.00 Median:96.00 stddev:0.67 (0.7%) stddev-sans-first:0.60 17:21:05 INFO - PROCESS | 22758 | Values: 97.0 96.0 96.0 96.0 96.0 96.0 95.0 97.0 96.0 95.0 17:21:05 INFO - PROCESS | 22758 | 17:21:05 INFO - PROCESS | 22758 | [#8] json-parse-financial Cycles:10 Average:56.80 Median:57.00 stddev:1.55 (2.7%) stddev-sans-first:1.64 17:21:05 INFO - PROCESS | 22758 | Values: 57.0 58.0 59.0 55.0 57.0 59.0 56.0 57.0 55.0 55.0 17:21:05 INFO - PROCESS | 22758 | 17:21:05 INFO - PROCESS | 22758 | [#9] json-stringify-tinderbox Cycles:10 Average:59.60 Median:60.00 stddev:0.70 (1.2%) stddev-sans-first:0.53 17:21:05 INFO - PROCESS | 22758 | Values: 61.0 59.0 59.0 60.0 60.0 60.0 60.0 59.0 59.0 59.0 17:21:05 INFO - PROCESS | 22758 | 17:21:05 INFO - PROCESS | 22758 | [#10] stanford-crypto-aes Cycles:10 Average:80.30 Median:80.00 stddev:2.45 (3.1%) stddev-sans-first:2.46 17:21:05 INFO - PROCESS | 22758 | Values: 78.0 86.0 83.0 79.0 80.0 80.0 79.0 78.0 80.0 80.0 17:21:05 INFO - PROCESS | 22758 | 17:21:05 INFO - PROCESS | 22758 | [#11] stanford-crypto-ccm Cycles:10 Average:113.80 Median:114.00 stddev:5.85 (5.1%) stddev-sans-first:5.75 17:21:05 INFO - PROCESS | 22758 | Values: 120.0 107.0 108.0 124.0 116.0 111.0 120.0 109.0 111.0 112.0 17:21:05 INFO - PROCESS | 22758 | 17:21:05 INFO - PROCESS | 22758 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:140.90 Median:141.00 stddev:4.31 (3.1%) stddev-sans-first:4.44 17:21:05 INFO - PROCESS | 22758 | Values: 138.0 138.0 152.0 141.0 138.0 137.0 140.0 141.0 142.0 142.0 17:21:05 INFO - PROCESS | 22758 | 17:21:05 INFO - PROCESS | 22758 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:63.70 Median:64.00 stddev:1.57 (2.4%) stddev-sans-first:1.54 17:21:05 INFO - PROCESS | 22758 | Values: 62.0 64.0 65.0 64.0 64.0 61.0 64.0 66.0 65.0 62.0 17:21:05 INFO - PROCESS | 22758 | -------- Summary: end -------- 17:21:05 INFO - PROCESS | 22758 | 17:21:06 INFO - TEST-INFO | 22758: exit 0 17:21:06 INFO - TEST-OK | kraken | took 60138ms 17:21:06 INFO - SUITE-END | took 1169s 17:21:06 INFO - Completed test suite (00:19:29) 17:21:06 INFO - javascript benchmark 17:21:06 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"lowerIsBetter": false, "subtests": [{"lowerIsBetter": false, "replicates": [3119.9532007019898, 3129.953050704239, 3158.510430883211, 3181.6182058153026, 3187.059817353882, 5347.144456886899, 5382.085045542258, 5410.91883621746, 5443.564514838813, 5452.91820622691, 5269.841904742854, 5357.571394288458, 5410.702411367373, 5492.066348720717, 5493.835184944448, 4876.634252431073, 4897.853064408056, 4955.653104282702, 5027.321311622921, 5119.488051194888, 4918.336024636682, 4923.212286034235, 4959.0, 4965.528274813887, 4976.925346119811, 4787.97058632394, 4881.853544393656, 4923.606111511071, 4949.158643030657, 4983.028309479653, 4885.340479035321, 4894.143524883167, 4904.779284932187, 4914.877128071791, 4929.408470983469, 4840.467548569654, 4877.487863774288, 4890.095332363524, 4894.583960363338, 4901.852944411673, 5344.5724342052545, 5389.461053894618, 5427.050266203399, 5440.374356948962, 5473.425290344536, 5756.7985120521, 5765.682887441189, 5766.596338256324, 5766.625169363978, 5767.5962682612235, 5582.246396736429, 5783.826485205451, 5799.565032622528, 5803.303603567557, 5846.123081537761, 5430.809921652763, 5436.3476382834315, 5436.401995780461, 5451.890962180734, 5485.6434331768705, 5909.202257695242, 5941.049432090845, 5946.791862284886, 5948.791792287336, 5952.791652292149, 5595.356533998561, 5673.8297851064535, 5679.77280908759, 5707.0, 5769.769209231667, 5734.2258795062135, 5743.167240750068, 5744.684042377626, 5747.913781293284, 5807.303123625107, 5612.214289999403, 5640.351359593699, 5649.265595472562, 5676.914846277309, 5694.288213973254, 5623.718814059363, 5719.0, 5732.971335143381, 5744.396838331915, 5776.624519406225, 4319.503257125408, 4377.4528183977, 4384.013596940663, 4390.121975604892, 4400.867973960786, 3885.339492286318, 3906.43356713275, 3917.177392747555, 3936.9606303936594, 3938.330483817758, 5546.473085056913, 5547.0, 5548.833534993957, 5573.6098473106495, 5574.944250557523, 5663.80176693822, 5755.251817263729, 5759.136129580513, 5829.271341082364, 5887.381824908323, 5462.7268636568015, 5499.202615620793, 5501.367342755554, 5508.779648814083, 5542.224088627595, 4978.5270399312, 4984.77568509418, 5002.674826136362, 5024.547790698854, 5049.394072711299, 5980.491658209101, 5993.400659933972, 6018.488428483628, 6032.819015429544, 6042.305134909454, 5741.0527263002805, 5834.795782147605, 5836.4747172753805, 5857.941420585739, 5912.852178695567, 6059.394060593905, 6060.333363329942, 6069.33237343883, 6085.66528840918, 6104.4505994460715, 5645.06856368711, 5695.943040569541, 5735.627184233178, 5743.97128014374, 5759.366469688414, 5640.0, 5755.913661295001, 5791.8552036199435, 5835.912461313169, 5837.737301821343, 5663.603547751618, 5678.488935995781, 5691.459311365414, 5693.11756677699, 5693.857653558694, 5552.639078459887, 5648.5481161507805, 5649.802256920988, 5660.830175094754, 5673.744681489426, 5493.697846618475, 5506.201600767786, 5506.311711036121, 5513.448655134454, 5551.333839939233, 5544.473275038865, 5586.273784408164, 5610.382857885547, 5618.438156184349, 5629.211910332475, 5488.4785945335125, 5521.723913804374, 5533.253010843485, 5542.224088627515, 5580.9441905580425], "unit": "score", "name": "dojo.html", "value": 5330.016021059385}, {"lowerIsBetter": false, "replicates": [570.6975303089363, 580.6748220996241, 587.556394921834, 599.0624672387715, 606.5663050918589, 36750.26499470009, 36807.26385472289, 36867.63132368676, 37422.25155496892, 37654.62345376545, 38038.23923521528, 38080.80959595198, 38109.61890381095, 38400.231995360075, 38497.61502384975, 8402.243798058189, 8550.059493455716, 8560.315174786003, 8561.914380856175, 8563.186497282779, 8411.32709383251, 8623.95688021559, 8676.783080423009, 8739.694110706127, 8746.125387461267, 8628.784280392978, 8743.081976392483, 8747.562621868912, 8748.562571871413, 8762.693305734301, 8702.086280940504, 8727.563621818916, 8763.56182190888, 8766.60550275239, 8779.561021948877, 8616.913830861673, 8735.563221838882, 8749.47503149813, 8760.912390876074, 8783.780405489913, 36763.63236367629, 36957.0, 36997.26005479902, 37069.25861482782, 37251.0, 3001.0, 3317.20387107095, 3368.831558422069, 3371.174062354739, 3691.4093745000673, 28200.576991345148, 28285.717142828515, 30729.231769205726, 31088.0, 31097.378052438824, 4272.551382104865, 4312.266914624522, 4316.266234740102, 4324.740515569076, 4326.545712700184, 211423.0, 212760.0, 213242.0, 213825.0, 214224.99999999843, 55820.16269755957, 55907.44092559022, 56047.43952560422, 56370.718146409825, 56719.432805671415, 59954.0, 60175.69912150411, 66323.33676663172, 67367.0, 67581.32418675849, 14084.436622534984, 14187.0, 14219.64450888736, 14325.713485730226, 14332.856671433361, 10827.891721082688, 10840.186985976083, 10853.186011049203, 10883.619073332395, 10889.945550272356, 19779.50551236202, 20044.0, 20064.0, 20127.899360503397, 20390.796092039185, 7788.337991270805, 8131.79670508242, 8180.304674102649, 8274.503529788231, 8320.16798320163, 1035.5961175141701, 1087.2986923434341, 1115.6820306212853, 1125.3754166437543, 1129.9774004519863, 31553.0, 31693.52459713106, 32031.51952720711, 32390.676093238766, 32560.348793024008, 1096.4517741129434, 1138.686861113184, 1152.7924973504682, 1187.5843454790754, 1244.4275633208645, 16027.439039633557, 16027.679446411006, 16203.432879849384, 16426.260818263207, 16464.176791160393, 383025.0, 384615.0, 386120.0, 387424.0, 387742.0, 54362.45637543653, 54961.725191374586, 55314.72342638342, 55352.0, 56538.71730641321, 1324.7946568281932, 1334.5195729537359, 1344.200200880494, 1351.6418149190276, 1358.9864101359058, 30351.544726829557, 30355.173394683163, 30827.383452331276, 31530.0, 31587.36825263528, 47790.0, 48322.758386207846, 48425.757871210415, 48610.0, 48624.0, 342632.0, 352976.0, 353177.0, 353326.0, 354425.0, 37085.25829483449, 37113.62886371102, 37340.813295933345, 37447.25105497929, 37739.43390849084, 47733.0, 48008.75995620139, 48440.5155948436, 48788.512114878395, 49078.5092149074, 39897.40153897636, 40492.19015619612, 41018.79490602528, 41173.588264116974, 41779.7911010443, 39188.80405597954, 40835.59164408318, 40980.79509602433, 41462.79268603637, 41842.372364413946, 37563.68527101538, 40001.79999099986, 40321.59678403178, 41006.1798764029, 41563.0, 31394.68605314009, 32382.35235295328, 33674.49488257629, 34935.47596786101, 34959.65040349564, 26729.732702672725, 27267.454650907268, 27338.45323093567, 27344.453110938066, 27388.46539917902], "unit": "score", "name": "ext.html", "value": 19139.404890106885}, {"lowerIsBetter": false, "replicates": [354.5302474221657, 361.82813163747215, 362.45450596851737, 364.9215418684982, 367.783008025265, 17153.313867445304, 17826.82173178268, 19522.31671891484, 19625.31311404101, 19692.90153549234, 18226.27094916205, 18730.0, 18947.147378367972, 18952.526186845334, 18961.62076758464, 5502.58730595205, 5772.769089236425, 5797.681127537984, 5805.10020946754, 5806.622569532967, 5656.745446454919, 6624.436922861562, 6897.586144831301, 6902.965485172567, 6915.585064896097, 6641.302663220365, 6838.316168383171, 6861.931380686204, 6874.518783685144, 6929.3070692930805, 6944.4444444444325, 6959.547629404073, 6982.301769823002, 7003.0, 7033.788986330418, 6610.537262391635, 6688.699008544579, 6701.698423570951, 6715.563488373289, 6870.553414028072, 23749.0, 24152.879235603887, 24548.0, 25103.497930041478, 25305.0, 2488.8880000399845, 2496.9750302496923, 2499.1003238834005, 2556.475922435915, 2974.925626859346, 14993.550193494213, 15291.0, 15834.604134896605, 16099.114548699818, 16226.43207487744, 2150.709654196695, 2182.639864422368, 2259.4464356232666, 2284.2589289253538, 2404.314770290459, 81309.0, 83762.58118709429, 85546.14453855506, 86575.0, 87525.12474875234, 17854.91072544629, 17913.10434478271, 18011.639767204582, 18112.547186320448, 18112.818871811112, 27385.31536711598, 27436.0, 27499.587506187425, 27757.918156137966, 27969.72030279712, 8411.411201215979, 8540.188682075193, 8587.828243435097, 8697.391182617283, 8788.91211087881, 7008.264132266038, 7095.787126386217, 7116.857662846817, 7224.0608720867, 7245.311695388929, 8486.151384861465, 8492.363072769567, 8678.088800675838, 8714.346424018224, 8758.737237882873, 1828.743975843383, 1860.3209828412532, 1883.8681292309407, 1886.9528261793564, 1902.6289873474539, 900.4147304252289, 956.7799406136628, 959.491469521155, 981.4454833019321, 1006.8540061691014, 17993.55016124581, 18210.54473638143, 18920.891528099753, 18925.337613183474, 19192.46460283174, 978.3885071830106, 1002.6791426743372, 1012.6961911426542, 1022.6829682798357, 1069.417167643636, 10357.74105647365, 10782.78434431307, 10822.40476773785, 10847.51186196623, 10918.1811364148, 500667.0, 508967.0, 515814.0, 526484.0, 530539.0, 80751.0, 81955.59022204851, 82362.58818705867, 84069.15930840613, 84190.57904710437, 1007.6725064354114, 1007.7480629842539, 1014.4217795856439, 1041.630221271453, 1075.1184029096223, 16632.168391580613, 16759.664806703553, 16768.077755723552, 16827.0, 16927.915360423613, 36089.63910360863, 36340.45489317715, 37133.62866371302, 37181.44227836639, 37361.0, 42367.788161059, 44385.11229775322, 45139.097218056115, 48185.0, 54222.0, 8114.959425202836, 8330.666773329, 8348.0, 8355.206255405727, 8454.83090338202, 12358.0, 12932.15940963872, 13133.73732525325, 13162.802557961446, 13276.203427794364, 11165.441727913734, 11439.256448330832, 11471.139664525028, 11488.425578721197, 11623.535058597561, 11221.887781122085, 11380.146489013192, 11452.198346115692, 11561.537538498365, 11571.768564628492, 11467.770644586895, 11686.94156529212, 11803.940980295043, 11816.82274765862, 11876.287422754662, 8086.83826323482, 8152.959235203786, 8228.547429891174, 8276.503409795432, 8469.280111190617, 10530.262881598215, 11297.15271354668, 11356.94321528387, 11543.653690389301, 11589.594364197214], "unit": "score", "name": "jquery.html", "value": 9843.110141014755}, {"lowerIsBetter": false, "replicates": [1435.425829668133, 1452.5279284232624, 1575.9212039398028, 1710.3586155191804, 1715.391036182156, 7736.110347310054, 7739.767806965786, 7854.7250846220395, 7968.521888686676, 7999.640016199271, 7915.762527124196, 7972.481788683732, 7992.680292788282, 8012.479188852721, 8074.071481779597, 2352.1179557665873, 2359.5634807560655, 2379.7739214774656, 2384.3800611840875, 2387.4270175157926, 2273.6703178039174, 2280.8745518996448, 2291.1522736587485, 2303.516261585069, 2309.261036468331, 2271.205078222625, 2273.27255278311, 2293.5986202414592, 2312.7340355859124, 2314.3404129823, 2330.8135349172026, 2339.8245131615113, 2346.2726554767905, 2359.775821296974, 2360.492494113765, 2344.5779759643256, 2352.3295860679623, 2363.2319496163814, 2363.83453158279, 2364.6571247169236, 7996.880436738861, 8008.199180082003, 8014.639341229658, 8032.39757018226, 8067.757967260992, 4989.675671081368, 5098.923516147261, 5119.334486516766, 5129.846104616868, 5142.0, 3196.616406031268, 3221.5650887130173, 3301.6698330167033, 3321.8339083045994, 3368.59576850777, 1023.7235946294459, 1025.077430312717, 1061.7398737309409, 1080.7247448011344, 1082.99458502707, 10918.617848375348, 10936.890631093667, 11048.171387145996, 11081.556737730481, 11108.055815255713, 4233.1956928183545, 4263.722858014281, 4331.960329520893, 4337.436133302651, 4365.650747940157, 8785.648574057093, 8790.208881200722, 8807.0, 8823.161799629024, 8857.11428857109, 4900.897298107897, 4919.532644398848, 4956.008798240367, 4966.205407134841, 4972.726500042532, 3895.980520097438, 4461.018575913294, 4470.083632855257, 4488.39406680094, 4591.678582499259, 3494.3186078714916, 3547.255076433926, 3570.071781336871, 3582.802945837952, 3583.7849729016343, 1109.4674556213063, 1112.7496313329598, 1127.0363838917608, 1128.700894263021, 1139.680889350983, 1152.3604399558326, 1165.854268216473, 1278.0989402471234, 1334.5195729537359, 1398.8321401431892, 7485.887711684329, 7485.925140748632, 7489.063867016623, 7602.1257555380735, 7670.578118203553, 469.31011413222507, 474.58948009971124, 477.18163349855166, 481.31653052665297, 484.1817328714461, 5826.0, 5891.96890544153, 5893.882122357529, 5897.498712609477, 5923.674197919069, 9357.157855793012, 9900.108990190918, 9938.453385063747, 10029.097381235579, 10058.798824023625, 9739.366941148803, 9743.415395076318, 9775.608975640895, 9781.510924453749, 9807.558659860324, 7392.55644661322, 7500.587467689329, 7556.282153195438, 7577.128630207597, 7594.924050759532, 7413.925860741324, 7467.215942325977, 7470.0662417197855, 7492.063492063492, 7537.359324457263, 8598.140185981352, 8727.345449091217, 8737.951445826542, 8740.0, 8903.510306932922, 8139.104698483044, 8945.955270223607, 8948.552572371485, 9045.412048216846, 9083.227925626396, 6154.0, 6901.24086350491, 7114.181869085121, 7122.465815063994, 7267.418606511572, 7629.046369203849, 7666.118396384487, 7683.654235559525, 7687.308142267223, 7774.961125194338, 6718.6976586054725, 6925.653717314013, 6996.300369962963, 6998.545094568837, 7048.259932707197, 6828.453723702191, 6898.172219333712, 6936.306369363225, 7010.719571217094, 7103.041089453064, 6846.212685541027, 7002.159740831133, 7037.648117593997, 7328.96335518319, 7414.8887766682465, 6526.216853977553, 6566.409023187936, 6624.105745724266, 6625.867482650417, 6628.867422651617, 6459.61242325462, 6525.902111468236, 6571.80284591463, 6573.40839324444, 6590.8352291193105], "unit": "score", "name": "mootools.html", "value": 4493.522867086494}, {"lowerIsBetter": false, "replicates": [327.04013719732586, 330.1136448635414, 330.2437418312064, 333.59468246081013, 333.7730343366513, 6307.590006649571, 6346.587471814335, 6422.775202867906, 6429.678516074201, 6463.644499552523, 6337.524685648584, 6353.587016843902, 6373.872522549546, 6377.744890204398, 6386.968065159679, 4548.772561371935, 4633.86098417048, 4779.80880764769, 4845.53967373099, 4849.321095046696, 4791.329213910055, 4836.153673107192, 4836.540528649773, 4839.5644392004715, 4867.977724677822, 4790.473047964721, 4796.328514008042, 4798.7840547175465, 4799.256115302133, 4805.927911081337, 4799.016201678665, 4804.543568361018, 4815.638827087965, 4816.951830481686, 4820.276958456225, 4201.663866890642, 4202.243596152692, 4204.369344598304, 4210.094829611618, 4212.831486740527, 5925.940740592582, 6081.878362432771, 6120.816375508697, 6147.385261473862, 6157.96921015392, 5539.224508568804, 5570.832875013756, 5625.071863142576, 5639.436056394369, 5667.744951477193, 6711.194656641185, 6721.932780672229, 6733.898991515082, 6735.7642482513365, 6737.19153701554, 4633.073385322915, 4660.091282199973, 4682.157211701892, 4694.953050469486, 4703.482616912137, 7000.159980802286, 7015.684294206773, 7035.4019908307855, 7075.469339799587, 7089.72384970705, 4764.052964767815, 4791.233402655628, 4827.782749776268, 4838.637102217348, 4845.3216549683075, 4839.225723884161, 4880.731559764176, 4887.902241955141, 4889.48660390661, 4895.192293271642, 5595.38450770415, 5600.551955843523, 5618.831435056954, 5635.971820140955, 5639.915401268984, 6755.088063111417, 6757.121574195323, 6766.18805743314, 6783.559068660521, 6807.523473356818, 1705.0792572011223, 1705.914704264782, 1716.0218675355177, 1716.7339062445342, 1720.5870591058306, 1118.8042092633757, 1143.4682872464343, 1149.781541507111, 1158.988410115905, 1175.7413369058793, 6530.8040758777315, 6553.541252112402, 6581.80254592363, 6601.075849381091, 6610.9669451652435, 6900.171979362408, 6975.476839236976, 6994.0, 7015.508914375945, 7031.753888613874, 6682.532222744361, 6715.127033485714, 6718.32816718334, 6719.395254427027, 6720.361565651256, 3785.1294202333065, 3826.6364695353896, 3829.2341531693774, 3831.8658846940225, 3837.175007373428, 7365.889511657329, 7394.223606521346, 7394.260573942563, 7407.111146662435, 7417.664820332392, 7002.404795592432, 7206.387457066103, 7245.130584329914, 7257.818554536178, 7264.818379540554, 7176.677049532888, 7193.856122877513, 7199.424046076301, 7208.35124838767, 7234.385077268491, 6938.653067346511, 6959.61722105289, 6962.338577835098, 7021.438284937295, 7070.151581810215, 6925.342092501204, 6984.231734509099, 6993.160820701345, 7001.194862590663, 7007.229204787572, 7147.749828755968, 7299.708011679473, 7340.376068034063, 7347.926520734724, 7373.262673732584, 4610.054938737484, 4623.69945953512, 4651.813927443, 4654.2785868190485, 4656.0, 6891.793246202622, 6987.755428559976, 7015.263397343206, 7044.049053377728, 7044.577325360495, 6785.796426107225, 6813.182418109858, 6822.249552549315, 6828.317168283132, 6849.349311815369, 6652.268250492345, 6818.488613353919, 6825.55633883796, 6826.317368263332, 6832.8725760249, 6696.129503164558, 6717.664116794239, 6728.9813056082, 6743.730250789913, 6775.559588626724, 6779.35596118368, 6829.863402732017, 6836.589804611739, 6836.726530938906, 6875.89686154698, 6608.570442921195, 6653.767118150841, 6677.966610166918, 6692.933070669231, 6697.899531507129], "unit": "score", "name": "prototype.html", "value": 5099.646687743093}, {"lowerIsBetter": false, "replicates": [777.8755399136138, 785.2147852147853, 785.2203200669629, 795.0538858758081, 802.5626033811573, 14450.277486125691, 14601.196934168616, 14614.780778288308, 14664.560063198094, 14674.339654715537, 13749.518766843163, 13761.931190344034, 13788.103773254732, 13803.585892423218, 13863.930680346584, 654.4241067860277, 815.388458656008, 816.8325493273894, 817.9182081791818, 820.8645573480369, 801.7434420985287, 804.3042768005691, 810.2221867007651, 810.8621534339177, 824.7690646618956, 857.9828403431927, 858.995705021474, 859.5616235719765, 862.2670729879615, 874.3136637739376, 852.9019162796264, 857.391252210931, 860.5095095795399, 860.9913900860973, 864.6843901975797, 640.3692363022419, 641.8138739765462, 642.6658137768381, 643.2538255623455, 643.768243432364, 14357.210353430557, 14388.64028399288, 14420.711585768226, 14449.494267700686, 14530.491432799907, 14253.857461425358, 14455.927720361437, 14505.492307769284, 14508.202048887308, 14518.346674399678, 11175.497102630401, 11327.773444531063, 11336.43317834105, 11579.189456738031, 11746.412679365998, 3767.7174211934216, 3768.434734789776, 3808.409696497047, 3817.6373244541724, 3889.0, 55460.0, 55919.0, 55988.0, 56370.71814640942, 56422.43577564213, 10970.835437468444, 11254.718632034264, 11293.265937714023, 11499.367534785668, 11527.654170374903, 20808.47978800542, 21114.0, 21118.577628447347, 21142.0, 21149.68275475869, 8293.626786794608, 8314.251717345467, 8336.208060234268, 8363.790905227297, 8367.8326433471, 4666.813327466931, 4747.098051370229, 4793.257045157937, 4818.71087734737, 4869.878253043702, 3007.2782532192555, 3029.5455681647927, 3033.4691428999836, 3036.6052413186144, 3040.331127152023, 548.1914176589498, 560.2828379674024, 562.7214528808184, 572.7794799002331, 575.4705670782889, 646.5118835279334, 670.7417644207015, 698.3191388396375, 724.5978481942573, 732.578767208857, 9318.627254909728, 9354.812903741888, 9528.475933823567, 9661.420314781135, 9825.919148893616, 599.5443462968176, 719.2483854372089, 728.1407938632465, 743.1676522295064, 759.8632246195627, 4317.414134972746, 4362.672799540047, 4384.714993525411, 4401.955980440154, 4467.7319360838455, 65229.34770652233, 67543.0, 67554.32445675578, 67749.66125169343, 68062.0, 50676.239856402186, 57022.71488642613, 57269.42730572641, 58670.7066464665, 59110.40889591049, 49344.50655493471, 51026.489735102914, 52610.0, 52721.73639131856, 53946.999999999214, 10016.499175041074, 10076.899231007596, 10143.492825358555, 10220.131288840532, 10261.58953641846, 38119.0, 38849.2230155401, 39635.0, 39994.60005400025, 40478.190436190525, 46922.29616555686, 50744.74627626838, 50993.74503127461, 51266.74366628143, 51349.74325128351, 12233.938830306148, 12330.383480825743, 12337.876621233672, 12520.186187897758, 12606.432710527864, 13662.590122296348, 13910.443582257001, 14421.495247666282, 14720.926395367955, 15181.165035922688, 12927.806082908575, 12986.480540778262, 13361.13152645075, 13377.464901403835, 13586.252756098509, 13022.153560018569, 13212.933935330262, 13219.801702974655, 13228.0, 13709.17744935307, 12256.14207005501, 12574.93712531468, 12872.356382180666, 13124.27816470065, 13704.588862334145, 10424.739381515523, 10555.736106597089, 10765.0, 10792.460376980962, 11230.494627741607, 10538.315009524356, 10630.149588033093, 10680.83978740335, 10892.074173695324, 10906.890931090906], "unit": "score", "name": "yui.html", "value": 6894.378641647361}], "name": "dromaeo_css", "value": 7357.69418303325}, {"lowerIsBetter": true, "subtests": [{"lowerIsBetter": true, "replicates": [112.0, 108.0, 111.0, 111.0, 113.0, 120.0, 111.0, 110.0, 110.0, 110.0], "unit": "score", "name": "ai-astar", "value": 111.6}, {"lowerIsBetter": true, "replicates": [156.0, 125.0, 154.0, 164.0, 128.0, 157.0, 155.0, 128.0, 172.0, 127.0], "unit": "score", "name": "audio-beat-detection", "value": 146.6}, {"lowerIsBetter": true, "replicates": [163.0, 162.0, 162.0, 163.0, 165.0, 162.0, 163.0, 167.0, 169.0, 162.0], "unit": "score", "name": "audio-dft", "value": 163.8}, {"lowerIsBetter": true, "replicates": [73.0, 72.0, 79.0, 80.0, 75.0, 72.0, 76.0, 76.0, 140.0, 76.0], "unit": "score", "name": "audio-fft", "value": 81.9}, {"lowerIsBetter": true, "replicates": [92.0, 93.0, 146.0, 92.0, 93.0, 94.0, 144.0, 93.0, 93.0, 140.0], "unit": "score", "name": "audio-oscillator", "value": 108.0}, {"lowerIsBetter": true, "replicates": [118.0, 117.0, 117.0, 121.0, 117.0, 117.0, 118.0, 117.0, 117.0, 117.0], "unit": "score", "name": "imaging-gaussian-blur", "value": 117.6}, {"lowerIsBetter": true, "replicates": [146.0, 146.0, 147.0, 147.0, 145.0, 147.0, 147.0, 146.0, 148.0, 146.0], "unit": "score", "name": "imaging-darkroom", "value": 146.5}, {"lowerIsBetter": true, "replicates": [97.0, 96.0, 96.0, 96.0, 96.0, 96.0, 95.0, 97.0, 96.0, 95.0], "unit": "score", "name": "imaging-desaturate", "value": 96.0}, {"lowerIsBetter": true, "replicates": [57.0, 58.0, 59.0, 55.0, 57.0, 59.0, 56.0, 57.0, 55.0, 55.0], "unit": "score", "name": "json-parse-financial", "value": 56.8}, {"lowerIsBetter": true, "replicates": [61.0, 59.0, 59.0, 60.0, 60.0, 60.0, 60.0, 59.0, 59.0, 59.0], "unit": "score", "name": "json-stringify-tinderbox", "value": 59.6}, {"lowerIsBetter": true, "replicates": [78.0, 86.0, 83.0, 79.0, 80.0, 80.0, 79.0, 78.0, 80.0, 80.0], "unit": "score", "name": "stanford-crypto-aes", "value": 80.3}, {"lowerIsBetter": true, "replicates": [120.0, 107.0, 108.0, 124.0, 116.0, 111.0, 120.0, 109.0, 111.0, 112.0], "unit": "score", "name": "stanford-crypto-ccm", "value": 113.8}, {"lowerIsBetter": true, "replicates": [138.0, 138.0, 152.0, 141.0, 138.0, 137.0, 140.0, 141.0, 142.0, 142.0], "unit": "score", "name": "stanford-crypto-pbkdf2", "value": 140.9}, {"lowerIsBetter": true, "replicates": [62.0, 64.0, 65.0, 64.0, 64.0, 61.0, 64.0, 66.0, 65.0, 62.0], "unit": "score", "name": "stanford-crypto-sha256-iterative", "value": 63.7}], "name": "kraken", "value": 1487.1}]} 17:21:06 INFO - Return code: 0 17:21:06 INFO - Validating PERFHERDER_DATA against /builds/slave/test-pgo/build/tests/talos/treeherder-schemas/performance-artifact.json 17:21:06 ERROR - # TBPL SUCCESS # 17:21:06 INFO - Running post-action listener: _resource_record_post_action 17:21:06 INFO - Running post-run listener: _resource_record_post_run 17:21:07 INFO - Total resource usage - Wall time: 1187s; CPU: 13.0%; Read bytes: 4096; Write bytes: 539033600; Read time: 12; Write time: 446344 17:21:07 INFO - install - Wall time: 17s; CPU: 14.0%; Read bytes: 0; Write bytes: 242589696; Read time: 0; Write time: 269248 17:21:07 INFO - run-tests - Wall time: 1171s; CPU: 13.0%; Read bytes: 4096; Write bytes: 296443904; Read time: 12; Write time: 177096 17:21:07 INFO - Running post-run listener: _upload_blobber_files 17:21:07 INFO - Blob upload gear active. 17:21:07 INFO - Preparing to upload files from /builds/slave/test-pgo/build/blobber_upload_dir. 17:21:07 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 17:21:07 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'] 17:21:07 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 17:21:07 INFO - (blobuploader) - INFO - Open directory for files ... 17:21:07 INFO - (blobuploader) - INFO - Uploading /builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs-e10s_raw.log ... 17:21:07 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 17:21:07 INFO - (blobuploader) - INFO - Uploading, attempt #1. 17:21:09 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_raw.log: uploaded 17:21:09 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 17:21:09 INFO - (blobuploader) - INFO - Done attempting. 17:21:09 INFO - (blobuploader) - INFO - Uploading /builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log ... 17:21:09 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 17:21:09 INFO - (blobuploader) - INFO - Uploading, attempt #1. 17:21:10 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_errorsummary.log: uploaded 17:21:10 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 17:21:10 INFO - (blobuploader) - INFO - Done attempting. 17:21:10 INFO - (blobuploader) - INFO - Iteration through files over. 17:21:10 INFO - Return code: 0 17:21:10 INFO - rmtree: /builds/slave/test-pgo/build/uploaded_files.json 17:21:10 INFO - retry: Calling remove with args: ('/builds/slave/test-pgo/build/uploaded_files.json',), kwargs: {}, attempt #1 17:21:10 INFO - Setting buildbot property blobber_files to {"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/c354178e73f2836698bf8264c94b02f1c3885a4981ffb3d5b8e750bf0d01d7a0dad6200a0ff29b560c2f9c2cbe1ce596db55cbe20a4e2edb3f588f20d2809caa", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/9b9b399d9207074710bbc14a3d32c910e713a4d845e03cd2e70a60643a150b5b91c647b0648c5d48b86e21d8caded849a9645e760d3f6a736dc7a97e67a310af"} 17:21:10 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test-pgo/properties/blobber_files 17:21:10 INFO - Writing to file /builds/slave/test-pgo/properties/blobber_files 17:21:10 INFO - Contents: 17:21:10 INFO - blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/c354178e73f2836698bf8264c94b02f1c3885a4981ffb3d5b8e750bf0d01d7a0dad6200a0ff29b560c2f9c2cbe1ce596db55cbe20a4e2edb3f588f20d2809caa", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/9b9b399d9207074710bbc14a3d32c910e713a4d845e03cd2e70a60643a150b5b91c647b0648c5d48b86e21d8caded849a9645e760d3f6a736dc7a97e67a310af"} 17:21:10 INFO - Running post-run listener: copy_logs_to_upload_dir 17:21:10 INFO - Copying logs to upload dir... 17:21:10 INFO - mkdir: /builds/slave/test-pgo/build/upload/logs 17:21:10 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1239.043395 ========= master_lag: 0.69 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 39 secs) (at 2016-03-17 17:21:11.199031) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-03-17 17:21:11.202041) ========= 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=00204705a9daa57ed339a427000001b9-1458258052.594903-820213356 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/c354178e73f2836698bf8264c94b02f1c3885a4981ffb3d5b8e750bf0d01d7a0dad6200a0ff29b560c2f9c2cbe1ce596db55cbe20a4e2edb3f588f20d2809caa", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/9b9b399d9207074710bbc14a3d32c910e713a4d845e03cd2e70a60643a150b5b91c647b0648c5d48b86e21d8caded849a9645e760d3f6a736dc7a97e67a310af"} build_url:https://queue.taskcluster.net/v1/task/OFRwGw3xRmOVFero6ljGbQ/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.009796 build_url: 'https://queue.taskcluster.net/v1/task/OFRwGw3xRmOVFero6ljGbQ/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2' blobber_files: '{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/c354178e73f2836698bf8264c94b02f1c3885a4981ffb3d5b8e750bf0d01d7a0dad6200a0ff29b560c2f9c2cbe1ce596db55cbe20a4e2edb3f588f20d2809caa", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/9b9b399d9207074710bbc14a3d32c910e713a4d845e03cd2e70a60643a150b5b91c647b0648c5d48b86e21d8caded849a9645e760d3f6a736dc7a97e67a310af"}' ========= master_lag: 0.02 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-03-17 17:21:11.231283) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-03-17 17:21:11.231583) ========= 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=00204705a9daa57ed339a427000001b9-1458258052.594903-820213356 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004591 ========= master_lag: 0.05 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-03-17 17:21:11.284425) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-03-17 17:21:11.285964) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-03-17 17:21:11.531074) ========= ========= Total master_lag: 0.96 =========