builder: fx-team_ubuntu64_hw_test-dromaeojs-e10s-pgo slave: talos-linux64-ix-027 starttime: 1456156758.49 results: success (0) buildid: 20160222053001 builduid: b8b05ce216e0454592cf8283b76ec024 revision: 1bd2197b4d48a08b4ceb46d28d0c9f494100d077 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-02-22 07:59:18.494278) ========= master: http://buildbot-master104.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-02-22 07:59:18.494931) ========= ========= Started set props: basedir (results: 0, elapsed: 0 secs) (at 2016-02-22 07:59:18.495240) ========= 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=1f5564757af27664ca02d71f000001b0-1456154404.465151-1259195796 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False /builds/slave/test-pgo program finished with exit code 0 elapsedTime=0.006711 basedir: '/builds/slave/test-pgo' ========= master_lag: 0.02 ========= ========= Finished set props: basedir (results: 0, elapsed: 0 secs) (at 2016-02-22 07:59:18.517320) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-02-22 07:59:18.517631) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-02-22 07:59:18.576137) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-02-22 07:59:18.576955) ========= 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=1f5564757af27664ca02d71f000001b0-1456154404.465151-1259195796 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004767 ========= master_lag: 0.05 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-02-22 07:59:18.636305) ========= ========= Started set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2016-02-22 07:59:18.636579) ========= script_repo_url: https://hg.mozilla.org/build/mozharness ========= Finished set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2016-02-22 07:59:18.637194) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-02-22 07:59:18.637490) ========= 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=1f5564757af27664ca02d71f000001b0-1456154404.465151-1259195796 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2016-02-22 07:59:18-- 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% 17.3M=0.001s 2016-02-22 07:59:19 (17.3 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.158184 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-02-22 07:59:18.812392) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-02-22 07:59:18.812683) ========= 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=1f5564757af27664ca02d71f000001b0-1456154404.465151-1259195796 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.017753 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-02-22 07:59:18.862252) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2016-02-22 07:59:18.862642) ========= bash -c 'python archiver_client.py mozharness --repo integration/fx-team --rev 1bd2197b4d48a08b4ceb46d28d0c9f494100d077 --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 1bd2197b4d48a08b4ceb46d28d0c9f494100d077 --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=1f5564757af27664ca02d71f000001b0-1456154404.465151-1259195796 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2016-02-22 07:59:19,142 truncating revision to first 12 chars 2016-02-22 07:59:19,142 Setting DEBUG logging. 2016-02-22 07:59:19,143 attempt 1/10 2016-02-22 07:59:19,143 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/integration/fx-team/1bd2197b4d48?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-02-22 07:59:20,423 unpacking tar archive at: fx-team-1bd2197b4d48/testing/mozharness/ program finished with exit code 0 elapsedTime=1.610320 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2016-02-22 07:59:20.486419) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-02-22 07:59:20.486762) ========= echo 1bd2197b4d48a08b4ceb46d28d0c9f494100d077 in dir /builds/slave/test-pgo/. (timeout 1200 secs) watching logfiles {} argv: ['echo', u'1bd2197b4d48a08b4ceb46d28d0c9f494100d077'] 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=1f5564757af27664ca02d71f000001b0-1456154404.465151-1259195796 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 1bd2197b4d48a08b4ceb46d28d0c9f494100d077 program finished with exit code 0 elapsedTime=0.003625 script_repo_revision: '1bd2197b4d48a08b4ceb46d28d0c9f494100d077' ========= master_lag: 0.04 ========= ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-02-22 07:59:20.534358) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-02-22 07:59:20.534633) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-02-22 07:59:20.543995) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 43 secs) (at 2016-02-22 07:59:20.544348) ========= /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=1f5564757af27664ca02d71f000001b0-1456154404.465151-1259195796 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 07:59:20 INFO - MultiFileLogger online at 20160222 07:59:20 in /builds/slave/test-pgo 07:59:20 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 07:59:20 INFO - Dumping config to /builds/slave/test-pgo/logs/localconfig.json. 07:59:20 INFO - {'append_to_log': False, 07:59:20 INFO - 'base_work_dir': '/builds/slave/test-pgo', 07:59:20 INFO - 'blob_upload_branch': 'Fx-Team', 07:59:20 INFO - 'blob_uploader_auth_file': '/builds/slave/test-pgo/oauth.txt', 07:59:20 INFO - 'branch': 'Fx-Team', 07:59:20 INFO - 'buildbot_json_path': 'buildprops.json', 07:59:20 INFO - 'config_files': ('talos/linux_config.py',), 07:59:20 INFO - 'default_actions': ('clobber', 07:59:20 INFO - 'read-buildbot-config', 07:59:20 INFO - 'download-and-extract', 07:59:20 INFO - 'populate-webroot', 07:59:20 INFO - 'create-virtualenv', 07:59:20 INFO - 'install', 07:59:20 INFO - 'run-tests'), 07:59:20 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 07:59:20 INFO - 'download_minidump_stackwalk': True, 07:59:20 INFO - 'download_symbols': 'ondemand', 07:59:20 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 07:59:20 INFO - 'tooltool.py': '/tools/tooltool.py', 07:59:20 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 07:59:20 INFO - '/tools/misc-python/virtualenv.py')}, 07:59:20 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 07:59:20 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 07:59:20 INFO - 'installer_path': 'installer.exe', 07:59:20 INFO - 'log_level': 'info', 07:59:20 INFO - 'log_name': 'talos', 07:59:20 INFO - 'log_to_console': True, 07:59:20 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 07:59:20 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 07:59:20 INFO - 'opt_config_files': (), 07:59:20 INFO - 'pip_index': False, 07:59:20 INFO - 'sps_profile': False, 07:59:20 INFO - 'sps_profile_interval': 0, 07:59:20 INFO - 'suite': 'dromaeojs-e10s', 07:59:20 INFO - 'system_bits': '32', 07:59:20 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 07:59:20 INFO - 'title': 'talos-linux64-ix-027', 07:59:20 INFO - 'tooltool_cache': '/builds/tooltool_cache', 07:59:20 INFO - 'use_talos_json': True, 07:59:20 INFO - 'virtualenv_path': '/builds/slave/test-pgo/build/venv', 07:59:20 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 07:59:20 INFO - 'work_dir': 'build'} 07:59:20 INFO - ##### 07:59:20 INFO - ##### Running clobber step. 07:59:20 INFO - ##### 07:59:20 INFO - Running pre-action listener: _resource_record_pre_action 07:59:20 INFO - Running main action method: clobber 07:59:20 INFO - rmtree: /builds/slave/test-pgo/build 07:59:20 INFO - retry: Calling rmtree with args: ('/builds/slave/test-pgo/build',), kwargs: {}, attempt #1 07:59:21 INFO - Running post-action listener: _resource_record_post_action 07:59:21 INFO - ##### 07:59:21 INFO - ##### Running read-buildbot-config step. 07:59:21 INFO - ##### 07:59:21 INFO - Running pre-action listener: _resource_record_pre_action 07:59:21 INFO - Running main action method: read_buildbot_config 07:59:21 INFO - Using buildbot properties: 07:59:21 INFO - { 07:59:21 INFO - "project": "", 07:59:21 INFO - "product": "firefox", 07:59:21 INFO - "script_repo_revision": "production", 07:59:21 INFO - "builddir": "fx-team_ubuntu64_hw_test-dromaeojs-e10s", 07:59:21 INFO - "repository": "", 07:59:21 INFO - "buildername": "Ubuntu HW 12.04 x64 fx-team pgo talos dromaeojs-e10s", 07:59:21 INFO - "buildid": "20160222053001", 07:59:21 INFO - "pgo_build": "True", 07:59:21 INFO - "basedir": "/builds/slave/test-pgo", 07:59:21 INFO - "buildnumber": 190, 07:59:21 INFO - "slavename": "talos-linux64-ix-027", 07:59:21 INFO - "master": "http://buildbot-master104.bb.releng.scl3.mozilla.com:8201/", 07:59:21 INFO - "platform": "ubuntu64_hw", 07:59:21 INFO - "scheduler": "tests-fx-team-linux64-pgo-talos", 07:59:21 INFO - "branch": "fx-team", 07:59:21 INFO - "repo_path": "integration/fx-team", 07:59:21 INFO - "revision": "1bd2197b4d48a08b4ceb46d28d0c9f494100d077", 07:59:21 INFO - "stage_platform": "linux64-pgo", 07:59:21 INFO - "builduid": "b8b05ce216e0454592cf8283b76ec024", 07:59:21 INFO - "slavebuilddir": "test" 07:59:21 INFO - } 07:59:21 INFO - Found installer url https://queue.taskcluster.net/v1/task/FB_X6UOKR9ioux6Ne_VENA/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2. 07:59:21 INFO - Running post-action listener: _resource_record_post_action 07:59:21 INFO - ##### 07:59:21 INFO - ##### Running download-and-extract step. 07:59:21 INFO - ##### 07:59:21 INFO - Running pre-action listener: _resource_record_pre_action 07:59:21 INFO - Running main action method: download_and_extract 07:59:21 INFO - mkdir: /builds/slave/test-pgo/build/tests 07:59:21 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 07:59:21 INFO - https://queue.taskcluster.net/v1/task/FB_X6UOKR9ioux6Ne_VENA/artifacts/public/build/test_packages.json matches https://queue.taskcluster.net 07:59:21 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FB_X6UOKR9ioux6Ne_VENA/artifacts/public/build/test_packages.json 07:59:21 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FB_X6UOKR9ioux6Ne_VENA/artifacts/public/build/test_packages.json 07:59:21 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FB_X6UOKR9ioux6Ne_VENA/artifacts/public/build/test_packages.json to /builds/slave/test-pgo/build/test_packages.json 07:59:21 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FB_X6UOKR9ioux6Ne_VENA/artifacts/public/build/test_packages.json', 'file_name': '/builds/slave/test-pgo/build/test_packages.json'}, attempt #1 07:59:25 INFO - Downloaded 1448 bytes. 07:59:25 INFO - Reading from file /builds/slave/test-pgo/build/test_packages.json 07:59:25 INFO - Using the following test package requirements: 07:59:25 INFO - {u'common': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip'], 07:59:25 INFO - u'cppunittest': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 07:59:25 INFO - u'firefox-47.0a1.en-US.linux-x86_64.cppunittest.tests.zip'], 07:59:25 INFO - u'gtest': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 07:59:25 INFO - u'firefox-47.0a1.en-US.linux-x86_64.gtest.tests.zip'], 07:59:25 INFO - u'jittest': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 07:59:25 INFO - u'jsshell-linux-x86_64.zip'], 07:59:25 INFO - u'mochitest': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 07:59:25 INFO - u'firefox-47.0a1.en-US.linux-x86_64.mochitest.tests.zip'], 07:59:25 INFO - u'mozbase': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip'], 07:59:25 INFO - u'reftest': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 07:59:25 INFO - u'firefox-47.0a1.en-US.linux-x86_64.reftest.tests.zip'], 07:59:25 INFO - u'talos': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 07:59:25 INFO - u'firefox-47.0a1.en-US.linux-x86_64.talos.tests.zip'], 07:59:25 INFO - u'web-platform': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 07:59:25 INFO - u'firefox-47.0a1.en-US.linux-x86_64.web-platform.tests.zip'], 07:59:25 INFO - u'webapprt': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip'], 07:59:25 INFO - u'xpcshell': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 07:59:25 INFO - u'firefox-47.0a1.en-US.linux-x86_64.xpcshell.tests.zip']} 07:59:25 INFO - Downloading packages: [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 07:59:25 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 07:59:25 INFO - https://queue.taskcluster.net/v1/task/FB_X6UOKR9ioux6Ne_VENA/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 07:59:25 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FB_X6UOKR9ioux6Ne_VENA/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip 07:59:25 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FB_X6UOKR9ioux6Ne_VENA/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip 07:59:25 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FB_X6UOKR9ioux6Ne_VENA/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip 07:59:25 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FB_X6UOKR9ioux6Ne_VENA/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 07:59:27 INFO - Downloaded 23366340 bytes. 07:59:27 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test-pgo/build/tests'] 07:59:27 INFO - Copy/paste: unzip -q -o /builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test-pgo/build/tests 07:59:28 INFO - Return code: 0 07:59:28 INFO - Downloading packages: [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', u'firefox-47.0a1.en-US.linux-x86_64.talos.tests.zip'] for test suite category: talos 07:59:28 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 07:59:28 INFO - https://queue.taskcluster.net/v1/task/FB_X6UOKR9ioux6Ne_VENA/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 07:59:28 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FB_X6UOKR9ioux6Ne_VENA/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip 07:59:28 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FB_X6UOKR9ioux6Ne_VENA/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip 07:59:28 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FB_X6UOKR9ioux6Ne_VENA/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip 07:59:28 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FB_X6UOKR9ioux6Ne_VENA/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 07:59:44 INFO - Downloaded 23366340 bytes. 07:59:44 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test-pgo/build/tests'] 07:59:44 INFO - Copy/paste: unzip -q -o /builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test-pgo/build/tests 07:59:45 INFO - Return code: 0 07:59:45 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 07:59:45 INFO - https://queue.taskcluster.net/v1/task/FB_X6UOKR9ioux6Ne_VENA/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.talos.tests.zip matches https://queue.taskcluster.net 07:59:45 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FB_X6UOKR9ioux6Ne_VENA/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.talos.tests.zip 07:59:45 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FB_X6UOKR9ioux6Ne_VENA/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.talos.tests.zip 07:59:45 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FB_X6UOKR9ioux6Ne_VENA/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.talos.tests.zip to /builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.talos.tests.zip 07:59:45 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FB_X6UOKR9ioux6Ne_VENA/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.talos.tests.zip', 'file_name': u'/builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.talos.tests.zip'}, attempt #1 07:59:46 INFO - Downloaded 10707015 bytes. 07:59:46 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.talos.tests.zip', '-d', '/builds/slave/test-pgo/build/tests'] 07:59:46 INFO - Copy/paste: unzip -q -o /builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.talos.tests.zip -d /builds/slave/test-pgo/build/tests 07:59:46 INFO - Return code: 0 07:59:46 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 07:59:46 INFO - https://queue.taskcluster.net/v1/task/FB_X6UOKR9ioux6Ne_VENA/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2 matches https://queue.taskcluster.net 07:59:46 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FB_X6UOKR9ioux6Ne_VENA/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2 07:59:46 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FB_X6UOKR9ioux6Ne_VENA/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2 07:59:46 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FB_X6UOKR9ioux6Ne_VENA/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2 to /builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2 07:59:46 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FB_X6UOKR9ioux6Ne_VENA/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2', 'file_name': '/builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2'}, attempt #1 07:59:47 INFO - Downloaded 56569146 bytes. 07:59:47 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/FB_X6UOKR9ioux6Ne_VENA/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2 07:59:47 INFO - mkdir: /builds/slave/test-pgo/properties 07:59:47 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test-pgo/properties/build_url 07:59:47 INFO - Writing to file /builds/slave/test-pgo/properties/build_url 07:59:47 INFO - Contents: 07:59:47 INFO - build_url:https://queue.taskcluster.net/v1/task/FB_X6UOKR9ioux6Ne_VENA/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2 07:59:48 INFO - Running post-action listener: _resource_record_post_action 07:59:48 INFO - Running post-action listener: set_extra_try_arguments 07:59:48 INFO - ##### 07:59:48 INFO - ##### Running populate-webroot step. 07:59:48 INFO - ##### 07:59:48 INFO - Running pre-action listener: _resource_record_pre_action 07:59:48 INFO - Running main action method: populate_webroot 07:59:48 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 07:59:48 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 07:59:48 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 07:59:48 INFO - '--tppagecycles', 07:59:48 INFO - '7'], 07:59:48 INFO - 'tests': ['tsvgm']}}, 07:59:48 INFO - 'suites': {'chromez': {'tests': ['tresize', 'tcanvasmark']}, 07:59:48 INFO - 'chromez-e10s': {'talos_options': ['--e10s'], 07:59:48 INFO - 'tests': ['tresize', 'tcanvasmark']}, 07:59:48 INFO - 'dromaeojs': {'tests': ['dromaeo_css', 'kraken']}, 07:59:48 INFO - 'dromaeojs-e10s': {'talos_options': ['--e10s'], 07:59:48 INFO - 'tests': ['dromaeo_css', 'kraken']}, 07:59:48 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 07:59:48 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 07:59:48 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 07:59:48 INFO - 'talos_options': ['--e10s'], 07:59:48 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 07:59:48 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 07:59:48 INFO - 'tests': ['damp', 'tps']}, 07:59:48 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 07:59:48 INFO - 'talos_options': ['--e10s'], 07:59:48 INFO - 'tests': ['damp', 'tps']}, 07:59:48 INFO - 'g3': {'tests': ['dromaeo_dom']}, 07:59:48 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 07:59:48 INFO - 'other': {'tests': ['a11yr', 07:59:48 INFO - 'ts_paint', 07:59:48 INFO - 'tpaint', 07:59:48 INFO - 'sessionrestore', 07:59:48 INFO - 'sessionrestore_no_auto_restore']}, 07:59:48 INFO - 'other-e10s': {'talos_options': ['--e10s'], 07:59:48 INFO - 'tests': ['a11yr', 07:59:48 INFO - 'ts_paint', 07:59:48 INFO - 'tpaint', 07:59:48 INFO - 'sessionrestore', 07:59:48 INFO - 'sessionrestore_no_auto_restore']}, 07:59:48 INFO - 'other-e10s_l64': {'talos_options': ['--e10s'], 07:59:48 INFO - 'tests': ['a11yr', 07:59:48 INFO - 'ts_paint', 07:59:48 INFO - 'tpaint', 07:59:48 INFO - 'sessionrestore', 07:59:48 INFO - 'sessionrestore_no_auto_restore']}, 07:59:48 INFO - 'other-e10s_nol64': {'talos_options': ['--e10s'], 07:59:48 INFO - 'tests': ['a11yr', 07:59:48 INFO - 'ts_paint', 07:59:48 INFO - 'tpaint', 07:59:48 INFO - 'sessionrestore', 07:59:48 INFO - 'sessionrestore_no_auto_restore']}, 07:59:48 INFO - 'other_l64': {'tests': ['a11yr', 07:59:48 INFO - 'ts_paint', 07:59:48 INFO - 'tpaint', 07:59:48 INFO - 'sessionrestore', 07:59:48 INFO - 'sessionrestore_no_auto_restore']}, 07:59:48 INFO - 'other_nol64': {'tests': ['a11yr', 07:59:48 INFO - 'ts_paint', 07:59:48 INFO - 'tpaint', 07:59:48 INFO - 'sessionrestore', 07:59:48 INFO - 'sessionrestore_no_auto_restore']}, 07:59:48 INFO - 'svgr': {'tests': ['tsvgx', 07:59:48 INFO - 'tsvgr_opacity', 07:59:48 INFO - 'tart', 07:59:48 INFO - 'tscrollx', 07:59:48 INFO - 'cart']}, 07:59:48 INFO - 'svgr-e10s': {'talos_options': ['--e10s'], 07:59:48 INFO - 'tests': ['tsvgx', 07:59:48 INFO - 'tsvgr_opacity', 07:59:48 INFO - 'tart', 07:59:48 INFO - 'tscrollx', 07:59:48 INFO - 'cart']}, 07:59:48 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 07:59:48 INFO - 'tests': ['tp5o']}, 07:59:48 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 07:59:48 INFO - 'talos_options': ['--e10s'], 07:59:48 INFO - 'tests': ['tp5o']}, 07:59:48 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 07:59:48 INFO - 'talos_options': ['--xperf_path', 07:59:48 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 07:59:48 INFO - 'tests': ['tp5n']}, 07:59:48 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 07:59:48 INFO - 'talos_options': ['--e10s', 07:59:48 INFO - '--xperf_path', 07:59:48 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 07:59:48 INFO - 'tests': ['tp5n']}}, 07:59:48 INFO - 'talos.zip': {'path': '', 07:59:48 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 07:59:48 INFO - Running post-action listener: _resource_record_post_action 07:59:48 INFO - ##### 07:59:48 INFO - ##### Running create-virtualenv step. 07:59:48 INFO - ##### 07:59:48 INFO - Running pre-action listener: _resource_record_pre_action 07:59:48 INFO - Running main action method: create_virtualenv 07:59:48 INFO - Creating virtualenv /builds/slave/test-pgo/build/venv 07:59:48 INFO - Running command: ['/tools/buildbot/bin/python', '/tools/misc-python/virtualenv.py', '--no-site-packages', '--distribute', '/builds/slave/test-pgo/build/venv'] in /builds/slave/test-pgo/build 07:59:48 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test-pgo/build/venv 07:59:48 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 07:59:48 INFO - Using real prefix '/usr' 07:59:48 INFO - New python executable in /builds/slave/test-pgo/build/venv/bin/python 07:59:49 INFO - Installing distribute.............................................................................................................................................................................................done. 07:59:51 INFO - Installing pip.................done. 07:59:51 INFO - Return code: 0 07:59:51 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test-pgo/build/venv 07:59: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')]} 07:59:51 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 07:59:51 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:59: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')]} 07:59:51 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 07:59:51 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:59:51 INFO - retry: Calling run_command with args: [['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f67f0ccbf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x21908a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x225d670>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x22ec8c0>, '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 0x22ed7c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x22edc50>, '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': '1f5564757af27664ca02d71f000001b0-1456154404.465151-1259195796', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test-pgo', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 07:59:51 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5'] in /builds/slave/test-pgo/build 07:59:51 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub pip>=1.5 07:59:51 INFO - Using env: {'DISPLAY': ':0', 07:59:51 INFO - 'HOME': '/home/cltbld', 07:59:51 INFO - 'LANG': 'en_US.UTF-8', 07:59:51 INFO - 'LANGUAGE': 'en_US:en', 07:59:51 INFO - 'LOGNAME': 'cltbld', 07:59:51 INFO - 'MAIL': '/var/mail/cltbld', 07:59:51 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 07:59:51 INFO - 'MOZ_NO_REMOTE': '1', 07:59:51 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 07:59:51 INFO - 'NO_EM_RESTART': '1', 07:59:51 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 07:59:51 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 07:59:51 INFO - 'PWD': '/builds/slave/test-pgo', 07:59:51 INFO - 'SHELL': '/bin/bash', 07:59:51 INFO - 'SHLVL': '1', 07:59:51 INFO - 'TERM': 'linux', 07:59:51 INFO - 'TMOUT': '86400', 07:59:51 INFO - 'USER': 'cltbld', 07:59:51 INFO - 'XDG_SESSION_COOKIE': '1f5564757af27664ca02d71f000001b0-1456154404.465151-1259195796', 07:59:51 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 07:59:51 INFO - '_': '/tools/buildbot/bin/python'} 07:59:51 INFO - Ignoring indexes: https://pypi.python.org/simple/ 07:59:51 INFO - Requirement already satisfied (use --upgrade to upgrade): pip>=1.5 in ./venv/lib/python2.7/site-packages/pip-1.5.5-py2.7.egg 07:59:51 INFO - Cleaning up... 07:59:51 INFO - Return code: 0 07:59:51 INFO - Installing psutil>=0.7.1 into virtualenv /builds/slave/test-pgo/build/venv 07:59: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')]} 07:59:51 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 07:59:51 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:59: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')]} 07:59:51 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 07:59:51 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:59:51 INFO - retry: Calling run_command with args: [['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', '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 0x7f67f0ccbf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x21908a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x225d670>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x22ec8c0>, '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 0x22ed7c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x22edc50>, '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': '1f5564757af27664ca02d71f000001b0-1456154404.465151-1259195796', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test-pgo', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 07:59:51 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=0.7.1'] in /builds/slave/test-pgo/build 07:59:51 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub psutil>=0.7.1 07:59:51 INFO - Using env: {'DISPLAY': ':0', 07:59:51 INFO - 'HOME': '/home/cltbld', 07:59:51 INFO - 'LANG': 'en_US.UTF-8', 07:59:51 INFO - 'LANGUAGE': 'en_US:en', 07:59:51 INFO - 'LOGNAME': 'cltbld', 07:59:51 INFO - 'MAIL': '/var/mail/cltbld', 07:59:51 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 07:59:51 INFO - 'MOZ_NO_REMOTE': '1', 07:59:51 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 07:59:51 INFO - 'NO_EM_RESTART': '1', 07:59:51 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 07:59:51 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 07:59:51 INFO - 'PWD': '/builds/slave/test-pgo', 07:59:51 INFO - 'SHELL': '/bin/bash', 07:59:51 INFO - 'SHLVL': '1', 07:59:51 INFO - 'TERM': 'linux', 07:59:51 INFO - 'TMOUT': '86400', 07:59:51 INFO - 'USER': 'cltbld', 07:59:51 INFO - 'XDG_SESSION_COOKIE': '1f5564757af27664ca02d71f000001b0-1456154404.465151-1259195796', 07:59:51 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 07:59:51 INFO - '_': '/tools/buildbot/bin/python'} 07:59:51 INFO - Ignoring indexes: https://pypi.python.org/simple/ 07:59:51 INFO - Downloading/unpacking psutil>=0.7.1 07:59:51 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 07:59:51 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 07:59:51 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:59:51 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:59:51 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 07:59:51 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 07:59:53 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/psutil/setup.py) egg_info for package psutil 07:59:53 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 07:59:53 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 07:59:53 INFO - Installing collected packages: psutil 07:59:53 INFO - Running setup.py install for psutil 07:59:53 INFO - building 'psutil._psutil_linux' extension 07:59:53 INFO - gcc -pthread -fno-strict-aliasing -DNDEBUG -g -fwrapv -O2 -Wall -Wstrict-prototypes -fPIC -DPSUTIL_VERSION=311 -I/usr/include/python2.7 -c psutil/_psutil_linux.c -o build/temp.linux-x86_64-2.7/psutil/_psutil_linux.o 07:59:53 INFO - gcc -pthread -shared -Wl,-O1 -Wl,-Bsymbolic-functions -Wl,-Bsymbolic-functions -Wl,-z,relro build/temp.linux-x86_64-2.7/psutil/_psutil_linux.o -o build/lib.linux-x86_64-2.7/psutil/_psutil_linux.so 07:59:53 INFO - building 'psutil._psutil_posix' extension 07:59:53 INFO - gcc -pthread -fno-strict-aliasing -DNDEBUG -g -fwrapv -O2 -Wall -Wstrict-prototypes -fPIC -I/usr/include/python2.7 -c psutil/_psutil_posix.c -o build/temp.linux-x86_64-2.7/psutil/_psutil_posix.o 07:59:54 INFO - gcc -pthread -shared -Wl,-O1 -Wl,-Bsymbolic-functions -Wl,-Bsymbolic-functions -Wl,-z,relro build/temp.linux-x86_64-2.7/psutil/_psutil_posix.o -o build/lib.linux-x86_64-2.7/psutil/_psutil_posix.so 07:59:54 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 07:59:54 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 07:59:54 INFO - Successfully installed psutil 07:59:54 INFO - Cleaning up... 07:59:54 INFO - Return code: 0 07:59:54 INFO - Installing mozsystemmonitor==0.0.0 into virtualenv /builds/slave/test-pgo/build/venv 07:59:54 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 07:59:54 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 07:59:54 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:59:54 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 07:59:54 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 07:59:54 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:59:54 INFO - retry: Calling run_command with args: [['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', '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 0x7f67f0ccbf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x21908a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x225d670>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x22ec8c0>, '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 0x22ed7c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x22edc50>, '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': '1f5564757af27664ca02d71f000001b0-1456154404.465151-1259195796', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test-pgo', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 07:59:54 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.0.0'] in /builds/slave/test-pgo/build 07:59:54 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub mozsystemmonitor==0.0.0 07:59:54 INFO - Using env: {'DISPLAY': ':0', 07:59:54 INFO - 'HOME': '/home/cltbld', 07:59:54 INFO - 'LANG': 'en_US.UTF-8', 07:59:54 INFO - 'LANGUAGE': 'en_US:en', 07:59:54 INFO - 'LOGNAME': 'cltbld', 07:59:54 INFO - 'MAIL': '/var/mail/cltbld', 07:59:54 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 07:59:54 INFO - 'MOZ_NO_REMOTE': '1', 07:59:54 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 07:59:54 INFO - 'NO_EM_RESTART': '1', 07:59:54 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 07:59:54 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 07:59:54 INFO - 'PWD': '/builds/slave/test-pgo', 07:59:54 INFO - 'SHELL': '/bin/bash', 07:59:54 INFO - 'SHLVL': '1', 07:59:54 INFO - 'TERM': 'linux', 07:59:54 INFO - 'TMOUT': '86400', 07:59:54 INFO - 'USER': 'cltbld', 07:59:54 INFO - 'XDG_SESSION_COOKIE': '1f5564757af27664ca02d71f000001b0-1456154404.465151-1259195796', 07:59:54 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 07:59:54 INFO - '_': '/tools/buildbot/bin/python'} 07:59:54 INFO - Ignoring indexes: https://pypi.python.org/simple/ 07:59:54 INFO - Downloading/unpacking mozsystemmonitor==0.0.0 07:59:54 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 07:59:54 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 07:59:54 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:59:54 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:59:54 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 07:59:54 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 07:59:56 INFO - Downloading mozsystemmonitor-0.0.tar.gz 07:59:56 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 07:59:56 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=0.7.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.0.0) 07:59:56 INFO - Installing collected packages: mozsystemmonitor 07:59:56 INFO - Running setup.py install for mozsystemmonitor 07:59:56 INFO - Successfully installed mozsystemmonitor 07:59:56 INFO - Cleaning up... 07:59:56 INFO - Return code: 0 07:59:56 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test-pgo/build/venv 07:59:56 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 07:59:56 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 07:59:56 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:59:56 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 07:59:56 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 07:59:56 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:59:56 INFO - retry: Calling run_command with args: [['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', '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 0x7f67f0ccbf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x21908a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x225d670>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x22ec8c0>, '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 0x22ed7c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x22edc50>, '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': '1f5564757af27664ca02d71f000001b0-1456154404.465151-1259195796', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test-pgo', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 07:59:56 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'blobuploader==1.2.4'] in /builds/slave/test-pgo/build 07:59:56 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub blobuploader==1.2.4 07:59:56 INFO - Using env: {'DISPLAY': ':0', 07:59:56 INFO - 'HOME': '/home/cltbld', 07:59:56 INFO - 'LANG': 'en_US.UTF-8', 07:59:56 INFO - 'LANGUAGE': 'en_US:en', 07:59:56 INFO - 'LOGNAME': 'cltbld', 07:59:56 INFO - 'MAIL': '/var/mail/cltbld', 07:59:56 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 07:59:56 INFO - 'MOZ_NO_REMOTE': '1', 07:59:56 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 07:59:56 INFO - 'NO_EM_RESTART': '1', 07:59:56 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 07:59:56 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 07:59:56 INFO - 'PWD': '/builds/slave/test-pgo', 07:59:56 INFO - 'SHELL': '/bin/bash', 07:59:56 INFO - 'SHLVL': '1', 07:59:56 INFO - 'TERM': 'linux', 07:59:56 INFO - 'TMOUT': '86400', 07:59:56 INFO - 'USER': 'cltbld', 07:59:56 INFO - 'XDG_SESSION_COOKIE': '1f5564757af27664ca02d71f000001b0-1456154404.465151-1259195796', 07:59:56 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 07:59:56 INFO - '_': '/tools/buildbot/bin/python'} 07:59:56 INFO - Ignoring indexes: https://pypi.python.org/simple/ 07:59:56 INFO - Downloading/unpacking blobuploader==1.2.4 07:59:56 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 07:59:56 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 07:59:56 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:59:56 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:59:56 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 07:59:56 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 07:59:58 INFO - Downloading blobuploader-1.2.4.tar.gz 07:59:58 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 07:59:58 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 07:59:58 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 07:59:58 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 07:59:58 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:59:58 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:59:58 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 07:59:58 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 07:59:58 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/requests/setup.py) egg_info for package requests 07:59:58 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 07:59:58 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 07:59:58 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 07:59:58 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:59:58 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:59:58 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 07:59:58 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 07:59:59 INFO - Downloading docopt-0.6.1.tar.gz 07:59:59 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/docopt/setup.py) egg_info for package docopt 07:59:59 INFO - Installing collected packages: blobuploader, requests, docopt 07:59:59 INFO - Running setup.py install for blobuploader 07:59:59 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 07:59:59 INFO - changing mode of /builds/slave/test-pgo/build/venv/bin/blobberc.py to 775 07:59:59 INFO - Running setup.py install for requests 07:59:59 INFO - Running setup.py install for docopt 07:59:59 INFO - Successfully installed blobuploader requests docopt 07:59:59 INFO - Cleaning up... 07:59:59 INFO - Return code: 0 07:59:59 INFO - Installing None into virtualenv /builds/slave/test-pgo/build/venv 07:59:59 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 07:59:59 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 07:59:59 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:59:59 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 07:59:59 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 07:59:59 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:59:59 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 0x7f67f0ccbf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x21908a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x225d670>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x22ec8c0>, '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 0x22ed7c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x22edc50>, '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': '1f5564757af27664ca02d71f000001b0-1456154404.465151-1259195796', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test-pgo', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 07:59:59 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--no-deps', '--timeout', '120', '-r', '/builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test-pgo/build/tests/config 07:59:59 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip install --no-deps --timeout 120 -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 07:59:59 INFO - Using env: {'DISPLAY': ':0', 07:59:59 INFO - 'HOME': '/home/cltbld', 07:59:59 INFO - 'LANG': 'en_US.UTF-8', 07:59:59 INFO - 'LANGUAGE': 'en_US:en', 07:59:59 INFO - 'LOGNAME': 'cltbld', 07:59:59 INFO - 'MAIL': '/var/mail/cltbld', 07:59:59 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 07:59:59 INFO - 'MOZ_NO_REMOTE': '1', 07:59:59 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 07:59:59 INFO - 'NO_EM_RESTART': '1', 07:59:59 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 07:59:59 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 07:59:59 INFO - 'PWD': '/builds/slave/test-pgo', 07:59:59 INFO - 'SHELL': '/bin/bash', 07:59:59 INFO - 'SHLVL': '1', 07:59:59 INFO - 'TERM': 'linux', 07:59:59 INFO - 'TMOUT': '86400', 07:59:59 INFO - 'USER': 'cltbld', 07:59:59 INFO - 'XDG_SESSION_COOKIE': '1f5564757af27664ca02d71f000001b0-1456154404.465151-1259195796', 07:59:59 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 07:59:59 INFO - '_': '/tools/buildbot/bin/python'} 07:59:59 INFO - Ignoring indexes: https://pypi.python.org/simple/ 07:59:59 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/manifestparser 07:59:59 INFO - Running setup.py (path:/tmp/pip-JIjWVF-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/manifestparser 08:00:00 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozcrash 08:00:00 INFO - Running setup.py (path:/tmp/pip-kP5uxh-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozcrash 08:00:00 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdebug 08:00:00 INFO - Running setup.py (path:/tmp/pip-Ck6OZr-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdebug 08:00:00 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdevice 08:00:00 INFO - Running setup.py (path:/tmp/pip-WxgVv6-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdevice 08:00:00 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozfile 08:00:00 INFO - Running setup.py (path:/tmp/pip-rE3nEb-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozfile 08:00:00 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozhttpd 08:00:00 INFO - Running setup.py (path:/tmp/pip-0nkXQV-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozhttpd 08:00:00 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinfo 08:00:00 INFO - Running setup.py (path:/tmp/pip-y7wJSO-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinfo 08:00:00 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinstall 08:00:00 INFO - Running setup.py (path:/tmp/pip-3VHNl9-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinstall 08:00:00 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozleak 08:00:00 INFO - Running setup.py (path:/tmp/pip-jQtLyU-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozleak 08:00:00 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozlog 08:00:00 INFO - Running setup.py (path:/tmp/pip-FnxGh3-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozlog 08:00:00 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moznetwork 08:00:00 INFO - Running setup.py (path:/tmp/pip-2BbOOW-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moznetwork 08:00:00 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprocess 08:00:00 INFO - Running setup.py (path:/tmp/pip-seiZYn-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprocess 08:00:00 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprofile 08:00:00 INFO - Running setup.py (path:/tmp/pip-sjts6v-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprofile 08:00:00 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozrunner 08:00:00 INFO - Running setup.py (path:/tmp/pip-O_mYKF-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozrunner 08:00:00 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 08:00:00 INFO - Running setup.py (path:/tmp/pip-WFSTcm-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 08:00:01 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moztest 08:00:01 INFO - Running setup.py (path:/tmp/pip-ie8zBL-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moztest 08:00:01 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozversion 08:00:01 INFO - Running setup.py (path:/tmp/pip-pqFxvN-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozversion 08:00:01 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 08:00:01 INFO - Running setup.py install for manifestparser 08:00:01 INFO - Installing manifestparser script to /builds/slave/test-pgo/build/venv/bin 08:00:01 INFO - Running setup.py install for mozcrash 08:00:01 INFO - Running setup.py install for mozdebug 08:00:01 INFO - Running setup.py install for mozdevice 08:00:01 INFO - Installing sutini script to /builds/slave/test-pgo/build/venv/bin 08:00:01 INFO - Installing dm script to /builds/slave/test-pgo/build/venv/bin 08:00:01 INFO - Running setup.py install for mozfile 08:00:01 INFO - Running setup.py install for mozhttpd 08:00:01 INFO - Installing mozhttpd script to /builds/slave/test-pgo/build/venv/bin 08:00:01 INFO - Running setup.py install for mozinfo 08:00:01 INFO - Installing mozinfo script to /builds/slave/test-pgo/build/venv/bin 08:00:01 INFO - Running setup.py install for mozInstall 08:00:01 INFO - Installing moz_remove_from_system script to /builds/slave/test-pgo/build/venv/bin 08:00:02 INFO - Installing mozuninstall script to /builds/slave/test-pgo/build/venv/bin 08:00:02 INFO - Installing mozinstall script to /builds/slave/test-pgo/build/venv/bin 08:00:02 INFO - Installing moz_add_to_system script to /builds/slave/test-pgo/build/venv/bin 08:00:02 INFO - Running setup.py install for mozleak 08:00:02 INFO - Running setup.py install for mozlog 08:00:02 INFO - Installing structlog script to /builds/slave/test-pgo/build/venv/bin 08:00:02 INFO - Running setup.py install for moznetwork 08:00:02 INFO - Installing moznetwork script to /builds/slave/test-pgo/build/venv/bin 08:00:02 INFO - Running setup.py install for mozprocess 08:00:02 INFO - Running setup.py install for mozprofile 08:00:02 INFO - Installing mozprofile script to /builds/slave/test-pgo/build/venv/bin 08:00:02 INFO - Installing diff-profiles script to /builds/slave/test-pgo/build/venv/bin 08:00:02 INFO - Installing view-profile script to /builds/slave/test-pgo/build/venv/bin 08:00:02 INFO - Running setup.py install for mozrunner 08:00:02 INFO - Installing mozrunner script to /builds/slave/test-pgo/build/venv/bin 08:00:02 INFO - Running setup.py install for mozscreenshot 08:00:02 INFO - Running setup.py install for moztest 08:00:02 INFO - Running setup.py install for mozversion 08:00:02 INFO - Installing mozversion script to /builds/slave/test-pgo/build/venv/bin 08:00:02 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 08:00:02 INFO - Cleaning up... 08:00:02 INFO - Return code: 0 08:00:02 INFO - Installing None into virtualenv /builds/slave/test-pgo/build/venv 08:00: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')]} 08:00:02 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:00:02 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:00: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')]} 08:00:02 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:00:02 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:00:02 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 0x7f67f0ccbf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x21908a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x225d670>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x22ec8c0>, '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 0x22ed7c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x22edc50>, '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': '1f5564757af27664ca02d71f000001b0-1456154404.465151-1259195796', '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 08:00:02 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 08:00:02 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 08:00:02 INFO - Using env: {'DISPLAY': ':0', 08:00:02 INFO - 'HOME': '/home/cltbld', 08:00:02 INFO - 'LANG': 'en_US.UTF-8', 08:00:02 INFO - 'LANGUAGE': 'en_US:en', 08:00:02 INFO - 'LOGNAME': 'cltbld', 08:00:02 INFO - 'MAIL': '/var/mail/cltbld', 08:00:02 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:00:02 INFO - 'MOZ_NO_REMOTE': '1', 08:00:02 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:00:02 INFO - 'NO_EM_RESTART': '1', 08:00:02 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:00:02 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 08:00:02 INFO - 'PWD': '/builds/slave/test-pgo', 08:00:02 INFO - 'SHELL': '/bin/bash', 08:00:02 INFO - 'SHLVL': '1', 08:00:02 INFO - 'TERM': 'linux', 08:00:02 INFO - 'TMOUT': '86400', 08:00:02 INFO - 'USER': 'cltbld', 08:00:02 INFO - 'XDG_SESSION_COOKIE': '1f5564757af27664ca02d71f000001b0-1456154404.465151-1259195796', 08:00:02 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:00:02 INFO - '_': '/tools/buildbot/bin/python'} 08:00:03 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:00:03 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/manifestparser 08:00:03 INFO - Running setup.py (path:/tmp/pip-uiRo0h-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/manifestparser 08:00:03 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)) 08:00:03 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozcrash 08:00:03 INFO - Running setup.py (path:/tmp/pip-L6slUQ-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozcrash 08:00:03 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash==0.16 from file:///builds/slave/test-pgo/build/tests/mozbase/mozcrash in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 2)) 08:00:03 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdebug 08:00:03 INFO - Running setup.py (path:/tmp/pip-Lgqd8P-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdebug 08:00:03 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)) 08:00:03 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdevice 08:00:03 INFO - Running setup.py (path:/tmp/pip-VTC5tv-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdevice 08:00:03 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)) 08:00:03 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozfile 08:00:03 INFO - Running setup.py (path:/tmp/pip-KqXYOg-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozfile 08:00:03 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)) 08:00:03 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozhttpd 08:00:03 INFO - Running setup.py (path:/tmp/pip-dHtHCB-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozhttpd 08:00:03 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)) 08:00:03 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinfo 08:00:03 INFO - Running setup.py (path:/tmp/pip-Py4GKk-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinfo 08:00:03 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)) 08:00:03 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinstall 08:00:03 INFO - Running setup.py (path:/tmp/pip-JPWYiB-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinstall 08:00:03 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)) 08:00:03 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozleak 08:00:03 INFO - Running setup.py (path:/tmp/pip-nMCDhK-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozleak 08:00:03 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)) 08:00:03 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozlog 08:00:03 INFO - Running setup.py (path:/tmp/pip-thG6Zp-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozlog 08:00:03 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)) 08:00:03 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moznetwork 08:00:03 INFO - Running setup.py (path:/tmp/pip-nlV2PZ-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moznetwork 08:00:03 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)) 08:00:03 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprocess 08:00:03 INFO - Running setup.py (path:/tmp/pip-4JFgEw-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprocess 08:00:04 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)) 08:00:04 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprofile 08:00:04 INFO - Running setup.py (path:/tmp/pip-1jHDUc-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprofile 08:00:04 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)) 08:00:04 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozrunner 08:00:04 INFO - Running setup.py (path:/tmp/pip-BLaIsB-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozrunner 08:00:04 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)) 08:00:04 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 08:00:04 INFO - Running setup.py (path:/tmp/pip-wpXWJR-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 08:00:04 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)) 08:00:04 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moztest 08:00:04 INFO - Running setup.py (path:/tmp/pip-Mbhuos-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moztest 08:00:04 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)) 08:00:04 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozversion 08:00:04 INFO - Running setup.py (path:/tmp/pip-mN4G0c-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozversion 08:00:04 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)) 08:00:04 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.0 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from mozcrash==0.16->-r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 2)) 08:00:04 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.0 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from mozcrash==0.16->-r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 2)) 08:00:04 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)) 08:00:04 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)) 08:00:04 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)) 08:00:04 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.1->-r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 10)) 08:00: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 08:00: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 08:00: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 08:00: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 08:00: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 08:00: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 08:00:06 INFO - Downloading blessings-1.6.tar.gz 08:00:06 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/blessings/setup.py) egg_info for package blessings 08:00:06 INFO - Installing collected packages: blessings 08:00:06 INFO - Running setup.py install for blessings 08:00:06 INFO - Successfully installed blessings 08:00:06 INFO - Cleaning up... 08:00:06 INFO - Return code: 0 08:00:06 INFO - Done creating virtualenv /builds/slave/test-pgo/build/venv. 08:00:06 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'freeze'] 08:00:06 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip freeze 08:00:06 INFO - Reading from file tmpfile_stdout 08:00:06 INFO - Current package versions: 08:00:06 INFO - argparse == 1.2.1 08:00:06 INFO - blessings == 1.6 08:00:06 INFO - blobuploader == 1.2.4 08:00:06 INFO - docopt == 0.6.1 08:00:06 INFO - manifestparser == 1.1 08:00:06 INFO - mozInstall == 1.12 08:00:06 INFO - mozcrash == 0.16 08:00:06 INFO - mozdebug == 0.1 08:00:06 INFO - mozdevice == 0.48 08:00:06 INFO - mozfile == 1.2 08:00:06 INFO - mozhttpd == 0.7 08:00:06 INFO - mozinfo == 0.9 08:00:06 INFO - mozleak == 0.1 08:00:06 INFO - mozlog == 3.1 08:00:06 INFO - moznetwork == 0.27 08:00:06 INFO - mozprocess == 0.22 08:00:06 INFO - mozprofile == 0.28 08:00:06 INFO - mozrunner == 6.11 08:00:06 INFO - mozscreenshot == 0.1 08:00:06 INFO - mozsystemmonitor == 0.0 08:00:06 INFO - moztest == 0.7 08:00:06 INFO - mozversion == 1.4 08:00:06 INFO - psutil == 3.1.1 08:00:06 INFO - requests == 1.2.3 08:00:06 INFO - wsgiref == 0.1.2 08:00:06 INFO - Installing None into virtualenv /builds/slave/test-pgo/build/venv 08:00:06 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')]} 08:00:06 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:00:06 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:00:06 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')]} 08:00:06 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:00:06 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:00:06 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 0x7f67f0ccbf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x21908a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x225d670>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x22ec8c0>, '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 0x22ed7c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x22edc50>, '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': '1f5564757af27664ca02d71f000001b0-1456154404.465151-1259195796', '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 08:00:06 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 08:00:06 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 08:00:06 INFO - Using env: {'DISPLAY': ':0', 08:00:06 INFO - 'HOME': '/home/cltbld', 08:00:06 INFO - 'LANG': 'en_US.UTF-8', 08:00:06 INFO - 'LANGUAGE': 'en_US:en', 08:00:06 INFO - 'LOGNAME': 'cltbld', 08:00:06 INFO - 'MAIL': '/var/mail/cltbld', 08:00:06 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:00:06 INFO - 'MOZ_NO_REMOTE': '1', 08:00:06 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:00:06 INFO - 'NO_EM_RESTART': '1', 08:00:06 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:00:06 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 08:00:06 INFO - 'PWD': '/builds/slave/test-pgo', 08:00:06 INFO - 'SHELL': '/bin/bash', 08:00:06 INFO - 'SHLVL': '1', 08:00:06 INFO - 'TERM': 'linux', 08:00:06 INFO - 'TMOUT': '86400', 08:00:06 INFO - 'USER': 'cltbld', 08:00:06 INFO - 'XDG_SESSION_COOKIE': '1f5564757af27664ca02d71f000001b0-1456154404.465151-1259195796', 08:00:06 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:00:06 INFO - '_': '/tools/buildbot/bin/python'} 08:00:06 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:00:06 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)) 08:00:06 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)) 08:00:06 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)) 08:00:06 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)) 08:00:06 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)) 08:00:06 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)) 08:00:06 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)) 08:00:06 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)) 08:00:06 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)) 08:00:06 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)) 08:00:06 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from mozhttpd>=0.7->-r /builds/slave/test-pgo/build/tests/talos/requirements.txt (line 4)) 08:00:06 INFO - Cleaning up... 08:00:06 INFO - Return code: 0 08:00:06 INFO - Installing jsonschema into virtualenv /builds/slave/test-pgo/build/venv 08:00:06 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')]} 08:00:06 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:00:06 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:00:06 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')]} 08:00:06 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:00:06 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:00:06 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 0x7f67f0ccbf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x21908a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x225d670>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x22ec8c0>, '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 0x22ed7c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x22edc50>, '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': '1f5564757af27664ca02d71f000001b0-1456154404.465151-1259195796', '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 08:00:06 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 08:00:06 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 08:00:06 INFO - Using env: {'DISPLAY': ':0', 08:00:06 INFO - 'HOME': '/home/cltbld', 08:00:06 INFO - 'LANG': 'en_US.UTF-8', 08:00:06 INFO - 'LANGUAGE': 'en_US:en', 08:00:06 INFO - 'LOGNAME': 'cltbld', 08:00:06 INFO - 'MAIL': '/var/mail/cltbld', 08:00:06 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:00:06 INFO - 'MOZ_NO_REMOTE': '1', 08:00:06 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:00:06 INFO - 'NO_EM_RESTART': '1', 08:00:06 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:00:06 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 08:00:06 INFO - 'PWD': '/builds/slave/test-pgo', 08:00:06 INFO - 'SHELL': '/bin/bash', 08:00:06 INFO - 'SHLVL': '1', 08:00:06 INFO - 'TERM': 'linux', 08:00:06 INFO - 'TMOUT': '86400', 08:00:06 INFO - 'USER': 'cltbld', 08:00:06 INFO - 'XDG_SESSION_COOKIE': '1f5564757af27664ca02d71f000001b0-1456154404.465151-1259195796', 08:00:06 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:00:06 INFO - '_': '/tools/buildbot/bin/python'} 08:00:07 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:00:07 INFO - Downloading/unpacking jsonschema 08:00:07 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:00:07 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:00:07 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:00:07 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:00:07 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:00:07 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:00:08 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 08:00:08 INFO - Downloading/unpacking functools32 (from jsonschema) 08:00:08 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 08:00:08 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 08:00:08 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 08:00:08 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 08:00:08 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 08:00:08 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 08:00:09 INFO - Downloading functools32-3.2.3-2.tar.gz 08:00:09 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/functools32/setup.py) egg_info for package functools32 08:00:09 INFO - warning: no files found matching '*.txt' 08:00:09 INFO - no previously-included directories found matching 'build' 08:00:09 INFO - no previously-included directories found matching 'dist' 08:00:09 INFO - no previously-included directories found matching '.git*' 08:00:09 INFO - Installing collected packages: jsonschema, functools32 08:00:09 INFO - Running setup.py install for functools32 08:00:09 INFO - warning: no files found matching '*.txt' 08:00:09 INFO - no previously-included directories found matching 'build' 08:00:09 INFO - no previously-included directories found matching 'dist' 08:00:09 INFO - no previously-included directories found matching '.git*' 08:00:09 INFO - Successfully installed jsonschema functools32 08:00:09 INFO - Cleaning up... 08:00:09 INFO - Return code: 0 08:00:09 INFO - Installing flake8 into virtualenv /builds/slave/test-pgo/build/venv 08:00:09 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 08:00:09 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:00:09 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:00:09 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 08:00:09 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:00:09 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:00:09 INFO - retry: Calling run_command with args: [['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'flake8']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f67f0ccbf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x21908a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x225d670>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x22ec8c0>, '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 0x22ed7c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x22edc50>, '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': '1f5564757af27664ca02d71f000001b0-1456154404.465151-1259195796', '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 08:00:09 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'flake8'] in /builds/slave/test-pgo/build 08:00:09 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub flake8 08:00:09 INFO - Using env: {'DISPLAY': ':0', 08:00:09 INFO - 'HOME': '/home/cltbld', 08:00:09 INFO - 'LANG': 'en_US.UTF-8', 08:00:09 INFO - 'LANGUAGE': 'en_US:en', 08:00:09 INFO - 'LOGNAME': 'cltbld', 08:00:09 INFO - 'MAIL': '/var/mail/cltbld', 08:00:09 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:00:09 INFO - 'MOZ_NO_REMOTE': '1', 08:00:09 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:00:09 INFO - 'NO_EM_RESTART': '1', 08:00:09 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:00:09 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 08:00:09 INFO - 'PWD': '/builds/slave/test-pgo', 08:00:09 INFO - 'SHELL': '/bin/bash', 08:00:09 INFO - 'SHLVL': '1', 08:00:09 INFO - 'TERM': 'linux', 08:00:09 INFO - 'TMOUT': '86400', 08:00:09 INFO - 'USER': 'cltbld', 08:00:09 INFO - 'XDG_SESSION_COOKIE': '1f5564757af27664ca02d71f000001b0-1456154404.465151-1259195796', 08:00:09 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:00:09 INFO - '_': '/tools/buildbot/bin/python'} 08:00:09 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:00:09 INFO - Downloading/unpacking flake8 08:00:09 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:00:09 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:00:09 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:00:09 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:00:09 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:00:09 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:00:11 INFO - Downloading flake8-2.5.0-py2.py3-none-any.whl 08:00:11 INFO - Downloading/unpacking mccabe>=0.2.1,<0.4 (from flake8) 08:00:11 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:00:11 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:00:11 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:00:11 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:00:11 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:00:11 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:00:11 INFO - Downloading mccabe-0.3.1-py2.py3-none-any.whl 08:00:11 INFO - Downloading/unpacking pyflakes>=0.8.1,<1.1 (from flake8) 08:00:11 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:00:11 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:00:11 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:00:11 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:00:11 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:00:11 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:00:11 INFO - Downloading/unpacking pep8>=1.5.7,!=1.6.0,!=1.6.1,!=1.6.2 (from flake8) 08:00:11 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:00:11 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:00:11 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:00:11 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:00:11 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:00:11 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:00:11 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/pep8/setup.py) egg_info for package pep8 08:00:12 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 08:00:12 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 08:00:12 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 08:00:12 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 08:00:12 INFO - no previously-included directories found matching 'docs/_build' 08:00:12 INFO - Installing collected packages: flake8, mccabe, pyflakes, pep8 08:00:12 INFO - Running setup.py install for pep8 08:00:12 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 08:00:12 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 08:00:12 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 08:00:12 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 08:00:12 INFO - no previously-included directories found matching 'docs/_build' 08:00:12 INFO - Installing pep8 script to /builds/slave/test-pgo/build/venv/bin 08:00:12 INFO - Successfully installed flake8 mccabe pyflakes pep8 08:00:12 INFO - Cleaning up... 08:00:12 INFO - Return code: 0 08:00:12 INFO - Running post-action listener: _resource_record_post_action 08:00:12 INFO - Running post-action listener: _start_resource_monitoring 08:00:12 INFO - Starting resource monitoring. 08:00:12 INFO - ##### 08:00:12 INFO - ##### Running install step. 08:00:12 INFO - ##### 08:00:12 INFO - Running pre-action listener: _resource_record_pre_action 08:00:12 INFO - Running main action method: install 08:00:12 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'freeze'] 08:00:12 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip freeze 08:00:12 INFO - Reading from file tmpfile_stdout 08:00:12 INFO - Detecting whether we're running mozinstall >=1.0... 08:00:12 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/mozinstall', '-h'] 08:00:12 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/mozinstall -h 08:00:12 INFO - Reading from file tmpfile_stdout 08:00:12 INFO - Output received: 08:00:12 INFO - Usage: mozinstall [options] installer 08:00:12 INFO - Options: 08:00:12 INFO - -h, --help show this help message and exit 08:00:12 INFO - -d DEST, --destination=DEST 08:00:12 INFO - Directory to install application into. [default: 08:00:12 INFO - "/builds/slave/test-pgo"] 08:00:12 INFO - --app=APP Application being installed. [default: firefox] 08:00:12 INFO - mkdir: /builds/slave/test-pgo/build/application 08:00:12 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/mozinstall', '/builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2', '--destination', '/builds/slave/test-pgo/build/application'] 08:00:12 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/mozinstall /builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2 --destination /builds/slave/test-pgo/build/application 08:00:28 INFO - Reading from file tmpfile_stdout 08:00:28 INFO - Output received: 08:00:28 INFO - /builds/slave/test-pgo/build/application/firefox/firefox 08:00:28 INFO - Running post-action listener: _resource_record_post_action 08:00:28 INFO - ##### 08:00:28 INFO - ##### Running run-tests step. 08:00:28 INFO - ##### 08:00:28 INFO - Running pre-action listener: _resource_record_pre_action 08:00:28 INFO - Running main action method: run_tests 08:00:28 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/python', '--version'] 08:00:28 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/python --version 08:00:28 INFO - Python 2.7.3 08:00:28 INFO - Return code: 0 08:00:28 INFO - grabbing minidump binary from tooltool 08:00:28 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 08:00:28 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 0x22ec8c0>, '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 0x22ed7c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x22edc50>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test-pgo/build', 'privileged': False}, attempt #1 08:00:28 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 08:00:28 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 08:00:28 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 08:00:28 INFO - Return code: 0 08:00:28 INFO - Chmoding /builds/slave/test-pgo/build/linux64-minidump_stackwalk to 0755 08:00:28 INFO - mkdir: /builds/slave/test-pgo/build/blobber_upload_dir 08:00:28 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test-pgo/build/blobber_upload_dir 08:00:28 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test-pgo/build/linux64-minidump_stackwalk 08:00:28 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test-pgo/build/blobber_upload_dir 08:00:28 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/flake8', '/builds/slave/test-pgo/build/tests/talos/talos'] 08:00:28 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/flake8 /builds/slave/test-pgo/build/tests/talos/talos 08:00:29 INFO - Return code: 0 08:00:29 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/FB_X6UOKR9ioux6Ne_VENA/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-027', '--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 08:00:29 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/FB_X6UOKR9ioux6Ne_VENA/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-027 --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 08:00:29 INFO - Using env: {'DISPLAY': ':0', 08:00:29 INFO - 'HOME': '/home/cltbld', 08:00:29 INFO - 'LANG': 'en_US.UTF-8', 08:00:29 INFO - 'LANGUAGE': 'en_US:en', 08:00:29 INFO - 'LOGNAME': 'cltbld', 08:00:29 INFO - 'MAIL': '/var/mail/cltbld', 08:00:29 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test-pgo/build/blobber_upload_dir', 08:00:29 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test-pgo/build/linux64-minidump_stackwalk', 08:00:29 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:00:29 INFO - 'MOZ_NO_REMOTE': '1', 08:00:29 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test-pgo/build/blobber_upload_dir', 08:00:29 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:00:29 INFO - 'NO_EM_RESTART': '1', 08:00:29 INFO - 'PATH': '/builds/slave/test-pgo/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:00:29 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 08:00:29 INFO - 'PWD': '/builds/slave/test-pgo', 08:00:29 INFO - 'PYTHONPATH': '/builds/slave/test-pgo/build/tests/talos', 08:00:29 INFO - 'SHELL': '/bin/bash', 08:00:29 INFO - 'SHLVL': '1', 08:00:29 INFO - 'TERM': 'linux', 08:00:29 INFO - 'TMOUT': '86400', 08:00:29 INFO - 'USER': 'cltbld', 08:00:29 INFO - 'XDG_SESSION_COOKIE': '1f5564757af27664ca02d71f000001b0-1456154404.465151-1259195796', 08:00:29 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:00:29 INFO - '_': '/tools/buildbot/bin/python'} 08:00:29 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/FB_X6UOKR9ioux6Ne_VENA/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-027', '--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 08:00:30 INFO - mozversion application_buildid: 20160222053001 08:00:30 INFO - mozversion application_changeset: 1bd2197b4d48a08b4ceb46d28d0c9f494100d077 08:00:30 INFO - mozversion application_display_name: Nightly 08:00:30 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 08:00:30 INFO - mozversion application_name: Firefox 08:00:30 INFO - mozversion application_remotingname: firefox 08:00:30 INFO - mozversion application_repository: https://hg.mozilla.org/integration/fx-team 08:00:30 INFO - mozversion application_vendor: Mozilla 08:00:30 INFO - mozversion application_version: 47.0a1 08:00:30 INFO - mozversion platform_buildid: 20160222053001 08:00:30 INFO - mozversion platform_changeset: 1bd2197b4d48a08b4ceb46d28d0c9f494100d077 08:00:30 INFO - mozversion platform_repository: https://hg.mozilla.org/integration/fx-team 08:00:30 INFO - mozversion platform_version: 47.0a1 08:00:30 INFO - using testdate: 1456156830 08:00:30 INFO - actual date: 1456156830 08:00:30 INFO - starting webserver on 'localhost:47153' 08:00:30 INFO - SUITE-START | Running 2 tests 08:00:30 INFO - TEST-START | dromaeo_css 08:00:30 INFO - operating with platform_type : linux_ 08:00:30 INFO - Initialising browser for dromaeo_css test... 08:00:30 INFO - TEST-INFO | started process 3192 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpxSsyt3/profile http://localhost:47153/getInfo.html) 08:00:33 INFO - PROCESS | 3192 | 08:00:33 INFO - PROCESS | 3192 | (process:3272): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 08:00:34 INFO - PROCESS | 3192 | __metrics Screen width/height:1600/1200 08:00:34 INFO - PROCESS | 3192 | colorDepth:24 08:00:34 INFO - PROCESS | 3192 | Browser inner width/height: 1024/697 08:00:34 INFO - PROCESS | 3192 | __metrics 08:00:35 ERROR - PROCESS | 3192 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 2844: TypeError: this.tabs is undefined 08:00:35 INFO - TEST-INFO | 3192: exit 0 08:00:35 INFO - Browser initialized. 08:00:35 INFO - Running cycle 1/1 for dromaeo_css test... 08:00:35 INFO - TEST-INFO | started process 3323 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpxSsyt3/profile -tp file:/builds/slave/test-pgo/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 08:00:37 INFO - PROCESS | 3323 | 08:00:37 INFO - PROCESS | 3323 | (process:3381): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 08:00:47 INFO - PROCESS | 3323 | RSS: Main: 155160576 08:00:47 INFO - PROCESS | 3323 | 08:01:37 INFO - PROCESS | 3323 | 1456156897298 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] 08:03:44 INFO - PROCESS | 3323 | Cycle 1(1): loaded http://localhost:47153/tests/dromaeo/cssquery-dojo.html (next: http://localhost:47153/tests/dromaeo/cssquery-ext.html) 08:03:46 INFO - PROCESS | 3323 | RSS: Main: 164331520 08:03:46 INFO - PROCESS | 3323 | 08:06:48 INFO - PROCESS | 3323 | Cycle 1(1): loaded http://localhost:47153/tests/dromaeo/cssquery-ext.html (next: http://localhost:47153/tests/dromaeo/cssquery-jquery.html) 08:06:48 INFO - PROCESS | 3323 | RSS: Main: 161345536 08:06:48 INFO - PROCESS | 3323 | 08:09:50 INFO - PROCESS | 3323 | Cycle 1(1): loaded http://localhost:47153/tests/dromaeo/cssquery-jquery.html (next: http://localhost:47153/tests/dromaeo/cssquery-mootools.html) 08:09:51 INFO - PROCESS | 3323 | RSS: Main: 160985088 08:09:51 INFO - PROCESS | 3323 | 08:12:52 INFO - PROCESS | 3323 | Cycle 1(1): loaded http://localhost:47153/tests/dromaeo/cssquery-mootools.html (next: http://localhost:47153/tests/dromaeo/cssquery-prototype.html) 08:12:53 INFO - PROCESS | 3323 | RSS: Main: 158380032 08:12:53 INFO - PROCESS | 3323 | 08:15:55 INFO - PROCESS | 3323 | Cycle 1(1): loaded http://localhost:47153/tests/dromaeo/cssquery-prototype.html (next: http://localhost:47153/tests/dromaeo/cssquery-yui.html) 08:15:56 INFO - PROCESS | 3323 | RSS: Main: 158384128 08:15:56 INFO - PROCESS | 3323 | 08:18:59 INFO - PROCESS | 3323 | Cycle 1(1): loaded http://localhost:47153/tests/dromaeo/cssquery-yui.html (next: http://localhost:47153/tests/dromaeo/cssquery-dojo.html) 08:18:59 INFO - PROCESS | 3323 | RSS: Main: 162775040 08:18:59 INFO - PROCESS | 3323 | 08:18:59 INFO - PROCESS | 3323 | __start_tp_report 08:18:59 INFO - PROCESS | 3323 | _x_x_mozilla_page_load 08:18:59 INFO - PROCESS | 3323 | _x_x_mozilla_page_load_details 08:18:59 INFO - PROCESS | 3323 | |i|pagename|runs| 08:18:59 INFO - PROCESS | 3323 | |0;dojo.html;3139.8273094979772;3145.0250422369068;3184.2835362043556;3200.503921892107;3204.9038528844144;5217.739113044351;5298.258243845859;5311.814086506968;5367.651102678323;5383.057964856149;5269.314989051418;5296.073187192245;5331.333583302087;5337.226102215176;5390.703511306877;4844.709317440956;4857.2714092886;4909.459959404463;4935.3090567320605;4948.331975183358;375.9343848016056;4897.583705385029;4905;4967.875803104916;5018.573421259179;4919.581835543965;4950.6287028472825;4958.702477851322;4960.826371077031;5008.524190201943;4812.590929770974;4949.381327334083;4957.454679985199;4992.550670439678;5028.949710502921;4847.951520484785;4860.1737704590305;4882.658213924991;4895.5838753705975;4919.655624106314;5057.949420505822;5072.9746351268;5088.465711100355;5102.438731739506;5143.794248230066;5515.448455154493;5642.830715078554;5648.4633959773755;5672.68800215988;5747.137929310595;5725.427457254283;5769.3076830780155;5783.045797443417;5794.68129252891;5795.681237531934;5395.757190926418;5399.5680345572655;5403.459654034605;5404.729763511848;5421.756020979065;5776.133579963039;5784.958707432703;5803.622764520293;5806.506446952057;5872.442117998783;5645.2096706461125;5655.4910058094965;5657.57568182388;5662.915056274077;5694.60137790359;5720.942790572124;5725.770969161187;5732.942670573324;5744.856378590569;5764.596478246566;5650.954573403851;5735.56871399051;5736.426357364314;5748.741306641127;5750.338711048283;5642.971785141131;5674.602777805597;5688.175214593861;5703.201551782754;5788.826335209867;4445.2887537993765;4457.576530229623;4460.30865215892;4487.4839393470165;4506.188886000551;3904.4338570907626;3968.940465893014;3984.7409918355215;4026.53694825093;4027.556968733437;5389.191621256843;5405.297311349499;5464.153056276284;5497.367802702661;5513.228148059275;5608.635438696471;5612.130119831432;5643.463870932255;5651.519620832275;5655.1517272409465;5267.710275934784;5335.306410166731;5379.6234263601955;5410.648307859977;5422.240886275925;4949.257611358325;4952.975235123801;4953.8266160684925;4963.329950456714;4974.030064137459;6009.308929473079;6025.0359942409;6032.577719559588;6042.909356359658;6061.969690151521;5677.318721753416;5693.174489699053;5706.087026075808;5726.4273572642405;5780.364159942319;5854.151148083419;5917.260342457193;5923.170756094064;5941.970290148522;5954.7915822947725;5598.412166722598;5631.2960879890015;5646;5650.85872853182;5678.20505129274;5744.224529688606;5788.681622510634;5814.622049566765;5832.504237139721;5841.1530328101335;5619.831405057855;5643.097104463266;5643.3792282848035;5657.094864821609;5667.574931880043;5517.255170552085;5579.107342825128;5613.438656134354;5644.068728659725;5667.121596152603;5451.536619387238;5498.092814685692;5513.2005859151;5521.619595101225;5534.363548192009;5492.093804522209;5580.107182850725;5598.468145526169;5629.802956896489;5630.155476678531;5503.559715222693;5510.779568817203;5546.195801608825;5618.016847051668;5648.181013752901 08:18:59 INFO - PROCESS | 3323 | |1;ext.html;520.1002266079681;521.1141060197665;525.5033992876731;542.6255883440426;544.0533471759136;35374.64625353746;35950.460743088806;36230.63769362306;36246;36351.272974540494;40234.19531609366;40890.386644200364;41159.79420102903;41216.79391603038;41310;8499.702510412137;8727.38908276421;8745.43154694946;8748.300135989106;8757.211850933414;8567.31461483083;8672.60973256205;8673.913260867374;8697.826043479126;8706.390552661285;8627.396082274243;8635.179657932518;8688.56557172142;8712.564371781416;8720.912790872073;8484.533350665712;8659.610317535695;8674.826503469927;8680.175383338636;8717.738467845975;8572.099929507374;8670.869936950889;8703.47779133254;8716.171963663443;8733.694320698745;38069.809650951844;38515;38618.227635447416;38641.42037869434;38764.41853372202;3171.2389026633673;3212.389645967282;3511.262634846685;3699.9075023124637;4021.3766866135797;28202.576961345596;28459.003934862387;29632;29823;30648.540271895938;3905.1799122184375;3958.2281455116263;3961.1681546875193;3982.581828907952;4053.7567745935044;277754;283108;285214;286186;286335;42609.78695106505;43091.7845410771;43335.34996975048;60559;61486;37680.24639507195;38699.806500967316;38730;38808;38899.61100389017;14445.711085778226;14600.488982885548;14714.63213419673;14729.189894555902;14776.482823101354;11681.824772628417;11781.293122412511;11834.289942603471;11862.466189021514;11900.523979040914;14170.574882753534;14296;14321.856781432261;14333.283335833166;14387;5752.7698892043845;5820.097884827858;5860.824175274749;5864.912026319608;5867.677277749679;952.3095755577151;956.4070276428658;1045.743792770776;1052.1687866585312;1091.061686949223;28585.85707071493;28588.714112858604;29578.260543486584;30825.691743082283;30889;1019.8419245017034;1026.3277553202665;1030.1398332392537;1076.838474228872;1147.3402793393832;15151.469698560497;15374.461893833886;15706;15850.128242946748;16070.598235044217;189818;194302;195123;195345;195805;55978.720106400026;56187.71906140443;56195;56395.71802140963;56615.58461038507;1342.7918672605763;1368.7330970460864;1371.1224816117494;1380.109829160186;1414.6958403943202;25633.743662563134;26997.73002269952;27469.76386062672;27616.309592260353;30469.23826904345;45554.77222613866;46462.07075858396;46501;46556.7672161637;46606;294320;294686;295221;296515;297656;43664.12671746484;43768;43978.34032489451;44047.77976110227;44336.77831610821;45817.312740309586;46194.157862026106;46442.30336544887;47073.529264706915;47228.291575625706;38500.037499062746;39522.60477395189;39724.80137599409;39901.80049099736;41138.38292425676;37917;38209.4268585977;39051.80474097611;40054.39918401168;40589.39115913323;34783.652163478044;35017.474737878445;38581.2283754329;39245.60754392534;39344.60655393524;29601;30899.845500772353;31846;32025.359492809548;32069.67930320667;24146.75853241445;24479.51040979206;25610.743892561582;25706.485870282864;25929.092481763048 08:18:59 INFO - PROCESS | 3323 | |2;jquery.html;347.1841173242878;356.47598030894574;356.6629535089341;364.39510412714884;367.3809630772151;16628.251728672207;16827.158642067894;17519;18343.908280458614;19068.809311906894;10929.672109836698;11036.282641628288;11142.721431964184;11161.162912781534;11221.887781122186;4731.077439899213;4902.632302577321;4926.45808961014;4941.579965702902;4957.107720610289;4635.351050852883;4831.879203019917;4904.950950490485;4908.141075311824;4926.211806111023;5015.598752099823;5148.304978827848;5199.038177937075;5322.0952438085615;5346.438623944488;5137.229415587692;5138.665986710889;5160.483951604847;5164;5178.249153872686;5265.157574788054;5331.840044798662;5341.706206158659;5350.384705758848;5366;12062.939685301604;12200.14598978063;12279.447424865903;12293.877061229363;12379;2043.8569300148995;2074.834013278934;2083.89231732403;2393.557191919483;2561.9359516012064;9068.68259610917;9213.539323033889;9295.48874811885;9361.29790265726;9455.392583260793;1810.411616224719;1890.2816929566677;1911.6750152474112;2013.7684166320914;2085.301424022954;44601;64676.676616617086;65709;66228;67447.66276168588;10399.58401663925;10402.323848949945;10492.895071049192;10499.632512862014;10566.260361774603;13588.796168057486;13663.521776737965;13686.931565342109;13786.103903246258;13848.784194528827;7724.6137693115115;7863.764087077397;7863.921360786433;7904.723334683374;7923.564203968837;7686.423518236154;7710.807229819299;7734.497257678233;7740.071191457061;7791.610419479003;4479.440069991251;4564.954350456453;4576.130535198368;4585.10590434862;4587.059652771174;1714.1257958441035;1771.4774141627993;1777.9111044447725;1796.6316905034437;1798.8740788144705;868.2055918834196;934.1265916368218;963.4171326347599;1003.5283416794096;1085.1264731890903;15711.68576628484;16126.677466450605;16760.245788939283;17145.82854171442;17185.91407042982;906.8367693815045;922.280621115531;938.9859152112724;946.6781294359951;1005.2460654509118;9578.712638620853;9955.25335599833;10042.497875106215;10205.642802501878;10286.2799604027;321412;326417;326921;328400;330590;67570.32429675739;68532.657336714;69907.65046174737;76281.23718762852;80489.19510804935;979.6375341123687;1006.5973610555836;1011.8229309870743;1029.3875144289136;1064.1858977881927;15919.522414327588;15971.12158831229;15990.760138597698;16022.599435014217;16464.42374516934;31647.208819778767;31659.050228493183;33022.66977330292;34540.481892771124;34746.478802818485;44937;47934.52065479301;47965.76017119892;48187.5181248183;48730.512694874014;7702.691892324245;7986.720464783704;8004.079530854026;8044.155363686728;8075.111737708965;11990.220635658654;13225.40485678166;13260.403281852532;13431.597052088453;13474.124181928144;10003.14973227284;10079;10437.373757574569;10717.249792514449;11321.603743868925;11033.668989930315;11054.834177487182;11097.945695158947;11257.943710281395;11398.316101033965;11034.668959931216;11104.833427498432;11197.552097916318;11278.548858045586;11295.548178072784;7607.429442791923;7783.571903545359;7789.415793815373;7997.600119994094;8068.273855352812;8917.866232006654;10876.45617719095;10987.450627468435;11114;11298.322100673986 08:18:59 INFO - PROCESS | 3323 | |3;mootools.html;1463.0051564935845;1488.791569180315;1656.2877962476139;1749.4576681228828;1799.064486467037;7354.558726476408;7525.698972041112;7599.734009309682;7618.466707330482;7671.731489397872;7721.72973945912;7733;7744;7780;7807;2276.203328834911;2281.087564974007;2291.415688999303;2292.862428254302;2307.1694190091553;2188.365374041526;2325.162941341116;2335.92992210234;2351.964720529185;2359.292212336301;1981.2966396929098;2253.4028482452163;2317.44381348476;2338.6141286687675;2350.25966820451;2214.1918199857096;2227.4988127671227;2227.766084561114;2242.416971587391;2247.101159536199;2198.230619283254;2259.954800903989;2277.738060123074;2282.783135602115;2286.039863257436;7604.733834315773;7644.46488745788;7672.616369181518;7678.040244969379;7688.730894418724;4582.725036497821;4669.182892993713;4726.409198850144;4746.572808447257;4748.5251474852585;3036.4382589221063;3061.1734831595345;3157.36852629475;3172.53998170264;3182.44307246231;984.1487113646645;993.7764003099317;1014.5890914179769;1046.8743750749882;1047.3035431438084;9661.275404344702;9689.70930872075;9834.9508252459;9974.351667141613;10090.243231757575;4001.299772539794;4019.1358857845703;4069.084455997436;4069.145479449349;4086.3257562501853;7972.60136993148;8002.759917202493;8039.8794018089775;8052.5571093590415;8054.114047454776;4626.028534007829;4629.213033784265;4629.236176030917;4629.791659375336;4630.930536041962;4265.914681706348;4283.657307415461;4292.678049146327;4300.053988122608;4319.460067491564;3198.4082944655315;3215.6302025266928;3226.2418331692033;3226.2902161524426;3252.1381833814057;1000.2548101664162;1004.081265641944;1005.3565717940523;1007.0483393193362;1011.7116621762763;973.9318247722733;1042.103790739963;1053.3574519543072;1083.566573370658;1136.3693150301663;7008.738427083174;7099.219085900547;7100.289971002859;7156.785296441115;7156.92843071573;602.6354055796268;621.1924498152384;629.4366541945025;631.2582715309493;769.0463824857137;5384.757685904144;5413.7834486620095;5487.2317875497465;5523.226748255248;5548.0845660466375;8921.866172007425;9158.587863546156;9237.584308706124;9273;9316.534173291308;9008.189262966234;9074.637014519345;9094.909050909539;9250.72247832566;9310.95344523273;7256.6734496947765;7299.781006569811;7316.561006339637;7344.889826652605;7349.522281051822;6937.895931561132;6996.125484314461;7033.577985320897;7047.154341479055;7059.082319298664;8220.63007164691;8235.95882020586;8259.297959673495;8320.375971802017;8437;8463.957680211559;8483.74548763538;8593.65625375003;8616.61225244878;8645.91354086451;6327.715252813542;6347.968260158855;6374;6417.807465776034;6418.326075761977;7284.490085694162;7307;7308.451866109956;7492.962535187289;7496.887546686913;6572.309907459839;6680.432163265982;6744.763933262312;6800.285969973082;6840.384365407137;6509.544331896722;6594.70323835419;6603.867922641616;6692;6715.597064176165;6871.896921546081;6938.410235130071;6986.371226589631;6988.545744526589;7000.404965577983;6425.646589437626;6452.419282264619;6467.320931302145;6468.3855033771715;6468.838279043061;6411.102445657519;6491.675416229265;6517.9348206517325;6533.640649764308;6545.0182472629485 08:18:59 INFO - PROCESS | 3323 | |4;prototype.html;331.64679616208736;334.743920900511;341.7214969799614;342.5632318793538;350.26444466620103;6170.537209709268;6235;6239.251289845225;6333.936660633392;6339.8098057058305;6229.127922090899;6251.843703907404;6267.655278959655;6285.654289014103;6326.367363263671;4836.105320515716;4851.466338702758;4864.367632207808;4882.902341953159;4884.902301953959;4846;4879.926801097987;4886.047220791947;4886.731229782361;4896.975515122419;4838.733869637169;4846.345743324641;4851.22380419133;4852.859577999185;4863.659543831933;4500.077484115748;4818.734969576672;4841.080194762983;4842.515748425165;4845.975770121145;4046.7774272415004;4048.8785336439955;4049.2711311963835;4050.7569545827346;4051.2910240707756;5878.265216847894;5892;5895.941040589582;5896.351401345849;5913.526917846562;5473.233747275384;5486.890262194774;5494.587905907033;5497.835064948058;5503.697296648683;6642.103316052319;6662.133922590032;6665.600063996128;6668.066470694107;6672.499562532829;4517.932231016537;4525.027119169362;4529.796159172845;4530.728156310632;4539.364488971547;6734.090897728793;6917.27368626292;6918.481113916426;6920.411764999981;6946.6179360135175;4616.884577885579;4627.375304333872;4632.768361581975;4633.957359594132;4647.604953578916;4661.370714953506;4672.813087476463;4693.577578017995;4696.718196908197;4712.034033023222;5484.095124304525;5494.5054945054335;5504.954058728828;5508.20131080991;5510.035743744828;6688.86622267552;6693.765718199839;6710.328967103348;6722.798316050526;6731.596104233761;1578.1162548972611;1655.2882260628046;1661.3271624991899;1663.517579901815;1664.67538829927;1066.1790421375651;1067.2209287220373;1080.9891901081046;1085.316250762015;1096.6107032003524;6196.535259855439;6248.781292654735;6261;6297.055441683784;6304.621722696653;6730.576992282774;6780.220274668378;6784.525083244224;6794.626295553792;6803.455723542104;6273.466755325757;6294.244690637152;6296.842578935563;6300.21247344082;6320.178376810985;3637.94543081854;3650.233450975325;3653.5067765851268;3666.651668091527;3673.2286219893585;7106.2183159852375;7134.714611415485;7322.670479828314;7327.816804579928;7335.633218339061;7093.255208203064;7105.218425973138;7107.502474826816;7122.821929451701;7131.429485641136;7253.202147763742;7254.455915806336;7261.092363454568;7273.163586187656;7283.963580182065;6920.7231710731;6927.618980956096;6934.653267336714;6935.583864968118;6940.618265995418;6666.766663166766;6828.487863410165;6892.827679308058;6894.413974812197;6910.20532638753;7207.675654595451;7224.349808517259;7231;7256.96371518139;7264.891026634499;4645.396098507173;4685.109829132454;4685.976570117127;4704.600108990774;4708.034852855225;6882;6909.792706218822;6912.55068420551;6913.585184888922;6914.654267286716;6488.967555162194;6706.865862682816;6713.328667133443;6741.157355330583;6741.393274605309;6692.899606506004;6736.528443008942;6756.358145976124;6810.455163586802;6817.420519255918;6541.934580654132;6556.246031706224;6582.670866456562;6586.571872828251;6616;6698.899516507159;6714.966425167843;6715.899261510984;6718.798436046926;6721.798346049626;6366.713497892513;6582.506312026521;6587.538872278895;6616.305287944697;6634.83412914681 08:18:59 INFO - PROCESS | 3323 | |5;yui.html;687.845234822165;787.4055088408247;787.8975733154691;789.9565523896183;802.0896282719116;12448.688782780424;12699.365031748423;12701.174423662467;12717.17338373005;12743.936280318609;12944.93527532361;12982.870171298284;13016.869831301685;13018.544350947719;13056.543020994244;809.8461292354464;811.8985126859143;827.210014436215;827.5365795154732;827.5407149032285;819.6721311475397;821.7370441458736;822.0341099208437;822.5352675738188;830.8047608811925;857.3826844671827;859.1065292096243;862.2627653356384;866.1338661338661;866.1901122450529;850.268768858781;857.065798279878;857.1771099744253;860.1226748716336;864.0365991918997;635.5170070746266;636.920384951881;637.2703254773305;637.3626373626373;639.3127388057857;13350.666233344147;13360.799588006188;13468.124571902796;13484.528041518597;13486.055976081678;12351.135420520568;12470.625881223486;12731.554395596202;12761.61715148547;12864;10605.151587872951;10628.36229826213;10639.840402393971;10937.781244375148;11405.828912566318;3621.474886141521;3654.7624404413627;3660.673719737775;3774.565924918642;3781.9054523636855;52188;52455.73772131115;52524.21213681798;52897;53436.465635343535;9860.605575777032;10119.241056920613;10122.746931326628;10465.42440165783;10560.735981600368;17656.117194140497;17852.732209016875;17942.102894855467;18160.18279177414;18204.089795510172;7600.2779735925;7700.229977002255;7842.960785196037;7870.6851725931465;7993.480423772437;4141.6065473779945;4170.874873753793;4253;4283.785810709514;4467.128909862546;2969.792114552004;2988.2529367658085;3002.789804713693;3005.7144571265694;3010;591.6834493545932;592.3040427497673;592.5259792166249;599.9610025348338;617.6294223465884;516.7390467813805;575.4217011903095;582.9970850145722;611.400827189357;641.4419455074022;8000.679972801139;8403.705870294632;8472.322214222848;8537.829243415097;8631.91368086311;620.512897375558;622.3714048810643;631.8072987738692;637.9266384365765;659.4526542969325;3857.3442514772555;3967.761934283952;4080.224757296104;4160.396742472324;4180.059486615487;60041;60865;61826.69086654538;61840;62105.68947155235;52404.47595524072;53185;53230.73384633052;53715;53994.730026349614;45653.31520027202;47387.52612473831;47804.76097619559;47867;48660;7773;8119.75640730779;8221.753347399588;8242.752717418487;8325.458845175044;34084.488732668535;34349.96950091501;34781.65218347885;34973.47539786956;35152.82423587866;42467.1506569873;45427.77286113548;45661.54338456573;45829.31256031096;46151.53848461472;10328.586856525655;10363;10420.739481512719;10495.107915826935;10519.526621302213;11289;11436.828447573127;11448;11696.122790790554;11796.233244839059;10207.183425326104;10294.794104117726;10300.278980471296;10334.328268662513;10477.476126193813;10766.89233107659;10770.353778773298;10975.890241097486;11103.50034248477;11135.053520450852;10352.378857268588;10958.506867191156;10964.890351096386;10971.561137554409;11004.339739615649;8829;8975.730728078168;9024.458532488072;9483.430994140374;9555.61777528891;8324.334053275603;8933.41952165492;9008;9121.589528471102;9278.304127190353 08:18:59 INFO - PROCESS | 3323 | __end_tp_report 08:18:59 INFO - PROCESS | 3323 | __start_cc_report 08:18:59 INFO - PROCESS | 3323 | _x_x_mozilla_cycle_collect,290 08:18:59 INFO - PROCESS | 3323 | __end_cc_report 08:18:59 INFO - PROCESS | 3323 | __startTimestamp1456157939272__endTimestamp 08:18:59 INFO - PROCESS | 3323 | 08:18:59 INFO - PROCESS | 3323 | ------- Summary: start ------- 08:18:59 INFO - PROCESS | 3323 | Number of tests: 6 08:18:59 INFO - PROCESS | 3323 | 08:18:59 INFO - PROCESS | 3323 | [#0] dojo.html Cycles:165 Average:5302.16 Median:5517.26 stddev:697.63 (12.6%) stddev-sans-first:678.83 08:18:59 INFO - PROCESS | 3323 | Values: 3139.8 3145.0 3184.3 3200.5 3204.9 5217.7 5298.3 5311.8 5367.7 5383.1 5269.3 5296.1 5331.3 5337.2 5390.7 4844.7 4857.3 4909.5 4935.3 4948.3 375.9 4897.6 4905.0 4967.9 5018.6 4919.6 4950.6 4958.7 4960.8 5008.5 4812.6 4949.4 4957.5 4992.6 5028.9 4848.0 4860.2 4882.7 4895.6 4919.7 5057.9 5073.0 5088.5 5102.4 5143.8 5515.4 5642.8 5648.5 5672.7 5747.1 5725.4 5769.3 5783.0 5794.7 5795.7 5395.8 5399.6 5403.5 5404.7 5421.8 5776.1 5785.0 5803.6 5806.5 5872.4 5645.2 5655.5 5657.6 5662.9 5694.6 5720.9 5725.8 5732.9 5744.9 5764.6 5651.0 5735.6 5736.4 5748.7 5750.3 5643.0 5674.6 5688.2 5703.2 5788.8 4445.3 4457.6 4460.3 4487.5 4506.2 3904.4 3968.9 3984.7 4026.5 4027.6 5389.2 5405.3 5464.2 5497.4 5513.2 5608.6 5612.1 5643.5 5651.5 5655.2 5267.7 5335.3 5379.6 5410.6 5422.2 4949.3 4953.0 4953.8 4963.3 4974.0 6009.3 6025.0 6032.6 6042.9 6062.0 5677.3 5693.2 5706.1 5726.4 5780.4 5854.2 5917.3 5923.2 5942.0 5954.8 5598.4 5631.3 5646.0 5650.9 5678.2 5744.2 5788.7 5814.6 5832.5 5841.2 5619.8 5643.1 5643.4 5657.1 5667.6 5517.3 5579.1 5613.4 5644.1 5667.1 5451.5 5498.1 5513.2 5521.6 5534.4 5492.1 5580.1 5598.5 5629.8 5630.2 5503.6 5510.8 5546.2 5618.0 5648.2 08:18:59 INFO - PROCESS | 3323 | 08:18:59 INFO - PROCESS | 3323 | [#1] ext.html Cycles:180 Average:42984.09 Median:38599.73 stddev:68287.71 (176.9%) stddev-sans-first:68404.85 08:18:59 INFO - PROCESS | 3323 | Values: 520.1 521.1 525.5 542.6 544.1 35374.6 35950.5 36230.6 36246.0 36351.3 40234.2 40890.4 41159.8 41216.8 41310.0 8499.7 8727.4 8745.4 8748.3 8757.2 8567.3 8672.6 8673.9 8697.8 8706.4 8627.4 8635.2 8688.6 8712.6 8720.9 8484.5 8659.6 8674.8 8680.2 8717.7 8572.1 8670.9 8703.5 8716.2 8733.7 38069.8 38515.0 38618.2 38641.4 38764.4 3171.2 3212.4 3511.3 3699.9 4021.4 28202.6 28459.0 29632.0 29823.0 30648.5 3905.2 3958.2 3961.2 3982.6 4053.8 277754.0 283108.0 285214.0 286186.0 286335.0 42609.8 43091.8 43335.3 60559.0 61486.0 37680.2 38699.8 38730.0 38808.0 38899.6 14445.7 14600.5 14714.6 14729.2 14776.5 11681.8 11781.3 11834.3 11862.5 11900.5 14170.6 14296.0 14321.9 14333.3 14387.0 5752.8 5820.1 5860.8 5864.9 5867.7 952.3 956.4 1045.7 1052.2 1091.1 28585.9 28588.7 29578.3 30825.7 30889.0 1019.8 1026.3 1030.1 1076.8 1147.3 15151.5 15374.5 15706.0 15850.1 16070.6 189818.0 194302.0 195123.0 195345.0 195805.0 55978.7 56187.7 56195.0 56395.7 56615.6 1342.8 1368.7 1371.1 1380.1 1414.7 25633.7 26997.7 27469.8 27616.3 30469.2 45554.8 46462.1 46501.0 46556.8 46606.0 294320.0 294686.0 295221.0 296515.0 297656.0 43664.1 43768.0 43978.3 44047.8 44336.8 45817.3 46194.2 46442.3 47073.5 47228.3 38500.0 39522.6 39724.8 39901.8 41138.4 37917.0 38209.4 39051.8 40054.4 40589.4 34783.7 35017.5 38581.2 39245.6 39344.6 29601.0 30899.8 31846.0 32025.4 32069.7 24146.8 24479.5 25610.7 25706.5 25929.1 08:18:59 INFO - PROCESS | 3323 | 08:18:59 INFO - PROCESS | 3323 | [#2] jquery.html Cycles:180 Average:21835.26 Median:181806.33 stddev:54107.23 (29.8%) stddev-sans-first:54234.96 08:18:59 INFO - PROCESS | 3323 | Values: 347.2 356.5 356.7 364.4 367.4 16628.3 16827.2 17519.0 18343.9 19068.8 10929.7 11036.3 11142.7 11161.2 11221.9 4731.1 4902.6 4926.5 4941.6 4957.1 4635.4 4831.9 4905.0 4908.1 4926.2 5015.6 5148.3 5199.0 5322.1 5346.4 5137.2 5138.7 5160.5 5164.0 5178.2 5265.2 5331.8 5341.7 5350.4 5366.0 12062.9 12200.1 12279.4 12293.9 12379.0 2043.9 2074.8 2083.9 2393.6 2561.9 9068.7 9213.5 9295.5 9361.3 9455.4 1810.4 1890.3 1911.7 2013.8 2085.3 44601.0 64676.7 65709.0 66228.0 67447.7 10399.6 10402.3 10492.9 10499.6 10566.3 13588.8 13663.5 13686.9 13786.1 13848.8 7724.6 7863.8 7863.9 7904.7 7923.6 7686.4 7710.8 7734.5 7740.1 7791.6 4479.4 4565.0 4576.1 4585.1 4587.1 1714.1 1771.5 1777.9 1796.6 1798.9 868.2 934.1 963.4 1003.5 1085.1 15711.7 16126.7 16760.2 17145.8 17185.9 906.8 922.3 939.0 946.7 1005.2 9578.7 9955.3 10042.5 10205.6 10286.3 321412.0 326417.0 326921.0 328400.0 330590.0 67570.3 68532.7 69907.7 76281.2 80489.2 979.6 1006.6 1011.8 1029.4 1064.2 15919.5 15971.1 15990.8 16022.6 16464.4 31647.2 31659.1 33022.7 34540.5 34746.5 44937.0 47934.5 47965.8 48187.5 48730.5 7702.7 7986.7 8004.1 8044.2 8075.1 11990.2 13225.4 13260.4 13431.6 13474.1 10003.1 10079.0 10437.4 10717.2 11321.6 11033.7 11054.8 11097.9 11257.9 11398.3 11034.7 11104.8 11197.6 11278.5 11295.5 7607.4 7783.6 7789.4 7997.6 8068.3 8917.9 10876.5 10987.5 11114.0 11298.3 08:18:59 INFO - PROCESS | 3323 | 08:18:59 INFO - PROCESS | 3323 | [#3] mootools.html Cycles:180 Average:5296.34 Median:6467.85 stddev:2734.97 (42.3%) stddev-sans-first:2727.47 08:18:59 INFO - PROCESS | 3323 | Values: 1463.0 1488.8 1656.3 1749.5 1799.1 7354.6 7525.7 7599.7 7618.5 7671.7 7721.7 7733.0 7744.0 7780.0 7807.0 2276.2 2281.1 2291.4 2292.9 2307.2 2188.4 2325.2 2335.9 2352.0 2359.3 1981.3 2253.4 2317.4 2338.6 2350.3 2214.2 2227.5 2227.8 2242.4 2247.1 2198.2 2260.0 2277.7 2282.8 2286.0 7604.7 7644.5 7672.6 7678.0 7688.7 4582.7 4669.2 4726.4 4746.6 4748.5 3036.4 3061.2 3157.4 3172.5 3182.4 984.1 993.8 1014.6 1046.9 1047.3 9661.3 9689.7 9835.0 9974.4 10090.2 4001.3 4019.1 4069.1 4069.1 4086.3 7972.6 8002.8 8039.9 8052.6 8054.1 4626.0 4629.2 4629.2 4629.8 4630.9 4265.9 4283.7 4292.7 4300.1 4319.5 3198.4 3215.6 3226.2 3226.3 3252.1 1000.3 1004.1 1005.4 1007.0 1011.7 973.9 1042.1 1053.4 1083.6 1136.4 7008.7 7099.2 7100.3 7156.8 7156.9 602.6 621.2 629.4 631.3 769.0 5384.8 5413.8 5487.2 5523.2 5548.1 8921.9 9158.6 9237.6 9273.0 9316.5 9008.2 9074.6 9094.9 9250.7 9311.0 7256.7 7299.8 7316.6 7344.9 7349.5 6937.9 6996.1 7033.6 7047.2 7059.1 8220.6 8236.0 8259.3 8320.4 8437.0 8464.0 8483.7 8593.7 8616.6 8645.9 6327.7 6348.0 6374.0 6417.8 6418.3 7284.5 7307.0 7308.5 7493.0 7496.9 6572.3 6680.4 6744.8 6800.3 6840.4 6509.5 6594.7 6603.9 6692.0 6715.6 6871.9 6938.4 6986.4 6988.5 7000.4 6425.6 6452.4 6467.3 6468.4 6468.8 6411.1 6491.7 6517.9 6533.6 6545.0 08:18:59 INFO - PROCESS | 3323 | 08:18:59 INFO - PROCESS | 3323 | [#4] prototype.html Cycles:180 Average:5569.76 Median:6289.95 stddev:1708.17 (27.2%) stddev-sans-first:1667.10 08:18:59 INFO - PROCESS | 3323 | Values: 331.6 334.7 341.7 342.6 350.3 6170.5 6235.0 6239.3 6333.9 6339.8 6229.1 6251.8 6267.7 6285.7 6326.4 4836.1 4851.5 4864.4 4882.9 4884.9 4846.0 4879.9 4886.0 4886.7 4897.0 4838.7 4846.3 4851.2 4852.9 4863.7 4500.1 4818.7 4841.1 4842.5 4846.0 4046.8 4048.9 4049.3 4050.8 4051.3 5878.3 5892.0 5895.9 5896.4 5913.5 5473.2 5486.9 5494.6 5497.8 5503.7 6642.1 6662.1 6665.6 6668.1 6672.5 4517.9 4525.0 4529.8 4530.7 4539.4 6734.1 6917.3 6918.5 6920.4 6946.6 4616.9 4627.4 4632.8 4634.0 4647.6 4661.4 4672.8 4693.6 4696.7 4712.0 5484.1 5494.5 5505.0 5508.2 5510.0 6688.9 6693.8 6710.3 6722.8 6731.6 1578.1 1655.3 1661.3 1663.5 1664.7 1066.2 1067.2 1081.0 1085.3 1096.6 6196.5 6248.8 6261.0 6297.1 6304.6 6730.6 6780.2 6784.5 6794.6 6803.5 6273.5 6294.2 6296.8 6300.2 6320.2 3637.9 3650.2 3653.5 3666.7 3673.2 7106.2 7134.7 7322.7 7327.8 7335.6 7093.3 7105.2 7107.5 7122.8 7131.4 7253.2 7254.5 7261.1 7273.2 7284.0 6920.7 6927.6 6934.7 6935.6 6940.6 6666.8 6828.5 6892.8 6894.4 6910.2 7207.7 7224.3 7231.0 7257.0 7264.9 4645.4 4685.1 4686.0 4704.6 4708.0 6882.0 6909.8 6912.6 6913.6 6914.7 6489.0 6706.9 6713.3 6741.2 6741.4 6692.9 6736.5 6756.4 6810.5 6817.4 6541.9 6556.2 6582.7 6586.6 6616.0 6698.9 6715.0 6715.9 6718.8 6721.8 6366.7 6582.5 6587.5 6616.3 6634.8 08:18:59 INFO - PROCESS | 3323 | 08:18:59 INFO - PROCESS | 3323 | [#5] yui.html Cycles:180 Average:13985.84 Median:47596.14 stddev:16761.91 (35.2%) stddev-sans-first:16779.18 08:18:59 INFO - PROCESS | 3323 | Values: 687.8 787.4 787.9 790.0 802.1 12448.7 12699.4 12701.2 12717.2 12743.9 12944.9 12982.9 13016.9 13018.5 13056.5 809.8 811.9 827.2 827.5 827.5 819.7 821.7 822.0 822.5 830.8 857.4 859.1 862.3 866.1 866.2 850.3 857.1 857.2 860.1 864.0 635.5 636.9 637.3 637.4 639.3 13350.7 13360.8 13468.1 13484.5 13486.1 12351.1 12470.6 12731.6 12761.6 12864.0 10605.2 10628.4 10639.8 10937.8 11405.8 3621.5 3654.8 3660.7 3774.6 3781.9 52188.0 52455.7 52524.2 52897.0 53436.5 9860.6 10119.2 10122.7 10465.4 10560.7 17656.1 17852.7 17942.1 18160.2 18204.1 7600.3 7700.2 7843.0 7870.7 7993.5 4141.6 4170.9 4253.0 4283.8 4467.1 2969.8 2988.3 3002.8 3005.7 3010.0 591.7 592.3 592.5 600.0 617.6 516.7 575.4 583.0 611.4 641.4 8000.7 8403.7 8472.3 8537.8 8631.9 620.5 622.4 631.8 637.9 659.5 3857.3 3967.8 4080.2 4160.4 4180.1 60041.0 60865.0 61826.7 61840.0 62105.7 52404.5 53185.0 53230.7 53715.0 53994.7 45653.3 47387.5 47804.8 47867.0 48660.0 7773.0 8119.8 8221.8 8242.8 8325.5 34084.5 34350.0 34781.7 34973.5 35152.8 42467.2 45427.8 45661.5 45829.3 46151.5 10328.6 10363.0 10420.7 10495.1 10519.5 11289.0 11436.8 11448.0 11696.1 11796.2 10207.2 10294.8 10300.3 10334.3 10477.5 10766.9 10770.4 10975.9 11103.5 11135.1 10352.4 10958.5 10964.9 10971.6 11004.3 8829.0 8975.7 9024.5 9483.4 9555.6 8324.3 8933.4 9008.0 9121.6 9278.3 08:18:59 INFO - PROCESS | 3323 | -------- Summary: end -------- 08:18:59 INFO - PROCESS | 3323 | 08:18:59 INFO - TEST-INFO | 3323: exit 0 08:18:59 INFO - TEST-OK | dromaeo_css | took 1109668ms 08:18:59 INFO - TEST-START | kraken 08:18:59 INFO - operating with platform_type : linux_ 08:18:59 INFO - Initialising browser for kraken test... 08:18:59 INFO - TEST-INFO | started process 3559 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmp2wlo05/profile http://localhost:47153/getInfo.html) 08:19:03 INFO - PROCESS | 3559 | 08:19:03 INFO - PROCESS | 3559 | (process:3633): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 08:19:04 INFO - PROCESS | 3559 | __metrics Screen width/height:1600/1200 08:19:04 INFO - PROCESS | 3559 | colorDepth:24 08:19:04 INFO - PROCESS | 3559 | Browser inner width/height: 1024/697 08:19:04 INFO - PROCESS | 3559 | __metrics 08:19:04 ERROR - PROCESS | 3559 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 2844: TypeError: this.tabs is undefined 08:19:05 INFO - TEST-INFO | 3559: exit 0 08:19:05 INFO - Browser initialized. 08:19:05 INFO - Running cycle 1/1 for kraken test... 08:19:05 INFO - TEST-INFO | started process 3684 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmp2wlo05/profile -tp file:/builds/slave/test-pgo/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 08:19:06 INFO - PROCESS | 3684 | 08:19:06 INFO - PROCESS | 3684 | (process:3742): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 08:19:17 INFO - PROCESS | 3684 | RSS: Main: 155627520 08:19:17 INFO - PROCESS | 3684 | 08:19:19 INFO - PROCESS | 3684 | Cycle 1(1): loaded http://localhost:47153/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:47153/tests/kraken/driver.html?testName=audio-beat-detection) 08:19:20 INFO - PROCESS | 3684 | RSS: Main: 161640448 08:19:20 INFO - PROCESS | 3684 | 08:19:23 INFO - PROCESS | 3684 | Cycle 1(1): loaded http://localhost:47153/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:47153/tests/kraken/driver.html?testName=audio-dft) 08:19:23 INFO - PROCESS | 3684 | RSS: Main: 165851136 08:19:23 INFO - PROCESS | 3684 | 08:19:26 INFO - PROCESS | 3684 | Cycle 1(1): loaded http://localhost:47153/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:47153/tests/kraken/driver.html?testName=audio-fft) 08:19:27 INFO - PROCESS | 3684 | RSS: Main: 158871552 08:19:27 INFO - PROCESS | 3684 | 08:19:29 INFO - PROCESS | 3684 | Cycle 1(1): loaded http://localhost:47153/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:47153/tests/kraken/driver.html?testName=audio-oscillator) 08:19:29 INFO - PROCESS | 3684 | RSS: Main: 158855168 08:19:29 INFO - PROCESS | 3684 | 08:19:32 INFO - PROCESS | 3684 | Cycle 1(1): loaded http://localhost:47153/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:47153/tests/kraken/driver.html?testName=imaging-gaussian-blur) 08:19:32 INFO - PROCESS | 3684 | RSS: Main: 158474240 08:19:32 INFO - PROCESS | 3684 | 08:19:35 INFO - PROCESS | 3684 | Cycle 1(1): loaded http://localhost:47153/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:47153/tests/kraken/driver.html?testName=imaging-darkroom) 08:19:36 INFO - PROCESS | 3684 | RSS: Main: 159465472 08:19:36 INFO - PROCESS | 3684 | 08:19:39 INFO - PROCESS | 3684 | Cycle 1(1): loaded http://localhost:47153/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:47153/tests/kraken/driver.html?testName=imaging-desaturate) 08:19:40 INFO - PROCESS | 3684 | RSS: Main: 159535104 08:19:40 INFO - PROCESS | 3684 | 08:19:43 INFO - PROCESS | 3684 | Cycle 1(1): loaded http://localhost:47153/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:47153/tests/kraken/driver.html?testName=json-parse-financial) 08:19:43 INFO - PROCESS | 3684 | RSS: Main: 161644544 08:19:43 INFO - PROCESS | 3684 | 08:19:45 INFO - PROCESS | 3684 | Cycle 1(1): loaded http://localhost:47153/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:47153/tests/kraken/driver.html?testName=json-stringify-tinderbox) 08:19:45 INFO - PROCESS | 3684 | RSS: Main: 162455552 08:19:45 INFO - PROCESS | 3684 | 08:19:47 INFO - PROCESS | 3684 | Cycle 1(1): loaded http://localhost:47153/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:47153/tests/kraken/driver.html?testName=stanford-crypto-aes) 08:19:48 INFO - PROCESS | 3684 | RSS: Main: 162623488 08:19:48 INFO - PROCESS | 3684 | 08:19:50 INFO - PROCESS | 3684 | Cycle 1(1): loaded http://localhost:47153/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:47153/tests/kraken/driver.html?testName=stanford-crypto-ccm) 08:19:51 INFO - PROCESS | 3684 | RSS: Main: 163098624 08:19:51 INFO - PROCESS | 3684 | 08:19:53 INFO - PROCESS | 3684 | Cycle 1(1): loaded http://localhost:47153/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:47153/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 08:19:54 INFO - PROCESS | 3684 | RSS: Main: 161849344 08:19:54 INFO - PROCESS | 3684 | 08:19:56 INFO - PROCESS | 3684 | Cycle 1(1): loaded http://localhost:47153/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:47153/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 08:19:57 INFO - PROCESS | 3684 | RSS: Main: 161316864 08:19:57 INFO - PROCESS | 3684 | 08:19:59 INFO - PROCESS | 3684 | Cycle 1(1): loaded http://localhost:47153/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:47153/tests/kraken/driver.html?testName=ai-astar) 08:19:59 INFO - PROCESS | 3684 | RSS: Main: 163090432 08:19:59 INFO - PROCESS | 3684 | 08:19:59 INFO - PROCESS | 3684 | __start_tp_report 08:19:59 INFO - PROCESS | 3684 | _x_x_mozilla_page_load 08:19:59 INFO - PROCESS | 3684 | _x_x_mozilla_page_load_details 08:19:59 INFO - PROCESS | 3684 | |i|pagename|runs| 08:19:59 INFO - PROCESS | 3684 | |0;ai-astar;113;108;115;113;114;124;115;113;113;114 08:19:59 INFO - PROCESS | 3684 | |1;audio-beat-detection;153;125;160;167;127;156;150;129;181;132 08:19:59 INFO - PROCESS | 3684 | |2;audio-dft;176;163;163;164;161;163;164;173;167;163 08:19:59 INFO - PROCESS | 3684 | |3;audio-fft;75;78;73;157;74;74;75;74;152;74 08:19:59 INFO - PROCESS | 3684 | |4;audio-oscillator;97;96;142;96;98;98;148;96;97;141 08:19:59 INFO - PROCESS | 3684 | |5;imaging-gaussian-blur;118;117;116;116;116;116;115;117;114;115 08:19:59 INFO - PROCESS | 3684 | |6;imaging-darkroom;147;148;148;148;147;146;147;147;147;148 08:19:59 INFO - PROCESS | 3684 | |7;imaging-desaturate;97;97;97;97;97;97;97;98;97;97 08:19:59 INFO - PROCESS | 3684 | |8;json-parse-financial;59;59;58;59;61;60;57;70;58;57 08:19:59 INFO - PROCESS | 3684 | |9;json-stringify-tinderbox;68;67;69;68;68;72;72;68;69;68 08:19:59 INFO - PROCESS | 3684 | |10;stanford-crypto-aes;83;84;84;84;93;84;87;84;85;84 08:19:59 INFO - PROCESS | 3684 | |11;stanford-crypto-ccm;118;132;131;116;123;127;116;119;130;122 08:19:59 INFO - PROCESS | 3684 | |12;stanford-crypto-pbkdf2;154;160;154;158;152;141;153;151;158;141 08:19:59 INFO - PROCESS | 3684 | |13;stanford-crypto-sha256-iterative;72;70;74;71;77;67;68;71;68;70 08:19:59 INFO - PROCESS | 3684 | __end_tp_report 08:19:59 INFO - PROCESS | 3684 | __start_cc_report 08:19:59 INFO - PROCESS | 3684 | _x_x_mozilla_cycle_collect,768 08:19:59 INFO - PROCESS | 3684 | __end_cc_report 08:19:59 INFO - PROCESS | 3684 | __startTimestamp1456157999289__endTimestamp 08:19:59 INFO - PROCESS | 3684 | 08:19:59 INFO - PROCESS | 3684 | ------- Summary: start ------- 08:19:59 INFO - PROCESS | 3684 | Number of tests: 14 08:19:59 INFO - PROCESS | 3684 | 08:19:59 INFO - PROCESS | 3684 | [#0] ai-astar Cycles:10 Average:114.20 Median:114.00 stddev:3.97 (3.5%) stddev-sans-first:4.18 08:19:59 INFO - PROCESS | 3684 | Values: 113.0 108.0 115.0 113.0 114.0 124.0 115.0 113.0 113.0 114.0 08:19:59 INFO - PROCESS | 3684 | 08:19:59 INFO - PROCESS | 3684 | [#1] audio-beat-detection Cycles:10 Average:148.00 Median:154.50 stddev:19.07 (12.3%) stddev-sans-first:20.14 08:19:59 INFO - PROCESS | 3684 | Values: 153.0 125.0 160.0 167.0 127.0 156.0 150.0 129.0 181.0 132.0 08:19:59 INFO - PROCESS | 3684 | 08:19:59 INFO - PROCESS | 3684 | [#2] audio-dft Cycles:10 Average:165.70 Median:164.00 stddev:4.92 (3.0%) stddev-sans-first:3.54 08:19:59 INFO - PROCESS | 3684 | Values: 176.0 163.0 163.0 164.0 161.0 163.0 164.0 173.0 167.0 163.0 08:19:59 INFO - PROCESS | 3684 | 08:19:59 INFO - PROCESS | 3684 | [#3] audio-fft Cycles:10 Average:90.60 Median:74.00 stddev:33.73 (45.6%) stddev-sans-first:35.30 08:19:59 INFO - PROCESS | 3684 | Values: 75.0 78.0 73.0 157.0 74.0 74.0 75.0 74.0 152.0 74.0 08:19:59 INFO - PROCESS | 3684 | 08:19:59 INFO - PROCESS | 3684 | [#4] audio-oscillator Cycles:10 Average:110.90 Median:96.50 stddev:22.69 (23.5%) stddev-sans-first:23.51 08:19:59 INFO - PROCESS | 3684 | Values: 97.0 96.0 142.0 96.0 98.0 98.0 148.0 96.0 97.0 141.0 08:19:59 INFO - PROCESS | 3684 | 08:19:59 INFO - PROCESS | 3684 | [#5] imaging-gaussian-blur Cycles:10 Average:116.00 Median:116.00 stddev:1.15 (1.0%) stddev-sans-first:0.97 08:19:59 INFO - PROCESS | 3684 | Values: 118.0 117.0 116.0 116.0 116.0 116.0 115.0 117.0 114.0 115.0 08:19:59 INFO - PROCESS | 3684 | 08:19:59 INFO - PROCESS | 3684 | [#6] imaging-darkroom Cycles:10 Average:147.30 Median:147.50 stddev:0.67 (0.5%) stddev-sans-first:0.71 08:19:59 INFO - PROCESS | 3684 | Values: 147.0 148.0 148.0 148.0 147.0 146.0 147.0 147.0 147.0 148.0 08:19:59 INFO - PROCESS | 3684 | 08:19:59 INFO - PROCESS | 3684 | [#7] imaging-desaturate Cycles:10 Average:97.10 Median:97.00 stddev:0.32 (0.3%) stddev-sans-first:0.33 08:19:59 INFO - PROCESS | 3684 | Values: 97.0 97.0 97.0 97.0 97.0 97.0 97.0 98.0 97.0 97.0 08:19:59 INFO - PROCESS | 3684 | 08:19:59 INFO - PROCESS | 3684 | [#8] json-parse-financial Cycles:10 Average:59.80 Median:59.00 stddev:3.79 (6.4%) stddev-sans-first:4.01 08:19:59 INFO - PROCESS | 3684 | Values: 59.0 59.0 58.0 59.0 61.0 60.0 57.0 70.0 58.0 57.0 08:19:59 INFO - PROCESS | 3684 | 08:19:59 INFO - PROCESS | 3684 | [#9] json-stringify-tinderbox Cycles:10 Average:68.90 Median:68.50 stddev:1.73 (2.5%) stddev-sans-first:1.80 08:19:59 INFO - PROCESS | 3684 | Values: 68.0 67.0 69.0 68.0 68.0 72.0 72.0 68.0 69.0 68.0 08:19:59 INFO - PROCESS | 3684 | 08:19:59 INFO - PROCESS | 3684 | [#10] stanford-crypto-aes Cycles:10 Average:85.20 Median:84.00 stddev:2.94 (3.5%) stddev-sans-first:3.00 08:19:59 INFO - PROCESS | 3684 | Values: 83.0 84.0 84.0 84.0 93.0 84.0 87.0 84.0 85.0 84.0 08:19:59 INFO - PROCESS | 3684 | 08:19:59 INFO - PROCESS | 3684 | [#11] stanford-crypto-ccm Cycles:10 Average:123.40 Median:125.00 stddev:6.22 (5.0%) stddev-sans-first:6.28 08:19:59 INFO - PROCESS | 3684 | Values: 118.0 132.0 131.0 116.0 123.0 127.0 116.0 119.0 130.0 122.0 08:19:59 INFO - PROCESS | 3684 | 08:19:59 INFO - PROCESS | 3684 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:152.20 Median:154.00 stddev:6.56 (4.3%) stddev-sans-first:6.93 08:19:59 INFO - PROCESS | 3684 | Values: 154.0 160.0 154.0 158.0 152.0 141.0 153.0 151.0 158.0 141.0 08:19:59 INFO - PROCESS | 3684 | 08:19:59 INFO - PROCESS | 3684 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:70.80 Median:71.00 stddev:3.01 (4.2%) stddev-sans-first:3.16 08:19:59 INFO - PROCESS | 3684 | Values: 72.0 70.0 74.0 71.0 77.0 67.0 68.0 71.0 68.0 70.0 08:19:59 INFO - PROCESS | 3684 | -------- Summary: end -------- 08:19:59 INFO - PROCESS | 3684 | 08:20:00 INFO - TEST-INFO | 3684: exit 0 08:20:00 INFO - TEST-OK | kraken | took 60260ms 08:20:00 INFO - SUITE-END | took 1169s 08:20:00 INFO - Completed test suite (00:19:30) 08:20:00 INFO - Working with test: dromaeo_css 08:20:00 INFO - Generating results file: dromaeo_css 08:20:00 INFO - Working with test: kraken 08:20:00 INFO - Generating results file: kraken 08:20:00 INFO - javascript benchmark 08:20:00 INFO - Posting result 0 of 2 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 08:20:00 INFO - process_Request line: dromaeo_css graph.html#tests=[[72,64,43]] 08:20:00 INFO - process_Request line: dromaeo_css 6849.57 graph.html#tests=[[72,64,43]] 08:20:00 INFO - Posting result 1 of 2 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 08:20:00 INFO - process_Request line: kraken 1550.10 graph.html#tests=[[232,64,43]] 08:20:00 INFO - RETURN: dromaeo_css: 6849.57 08:20:00 INFO - RETURN: kraken: 1550.10 08:20:00 INFO - javascript benchmark 08:20:00 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"lowerIsBetter": false, "subtests": [{"lowerIsBetter": false, "replicates": [3139.8273094979772, 3145.0250422369068, 3184.2835362043556, 3200.503921892107, 3204.9038528844144, 5217.739113044351, 5298.258243845859, 5311.814086506968, 5367.651102678323, 5383.057964856149, 5269.314989051418, 5296.073187192245, 5331.333583302087, 5337.226102215176, 5390.703511306877, 4844.709317440956, 4857.2714092886, 4909.459959404463, 4935.3090567320605, 4948.331975183358, 375.9343848016056, 4897.583705385029, 4905.0, 4967.875803104916, 5018.573421259179, 4919.581835543965, 4950.6287028472825, 4958.702477851322, 4960.826371077031, 5008.524190201943, 4812.590929770974, 4949.381327334083, 4957.454679985199, 4992.550670439678, 5028.949710502921, 4847.951520484785, 4860.1737704590305, 4882.658213924991, 4895.5838753705975, 4919.655624106314, 5057.949420505822, 5072.9746351268, 5088.465711100355, 5102.438731739506, 5143.794248230066, 5515.448455154493, 5642.830715078554, 5648.4633959773755, 5672.68800215988, 5747.137929310595, 5725.427457254283, 5769.3076830780155, 5783.045797443417, 5794.68129252891, 5795.681237531934, 5395.757190926418, 5399.5680345572655, 5403.459654034605, 5404.729763511848, 5421.756020979065, 5776.133579963039, 5784.958707432703, 5803.622764520293, 5806.506446952057, 5872.442117998783, 5645.2096706461125, 5655.4910058094965, 5657.57568182388, 5662.915056274077, 5694.60137790359, 5720.942790572124, 5725.770969161187, 5732.942670573324, 5744.856378590569, 5764.596478246566, 5650.954573403851, 5735.56871399051, 5736.426357364314, 5748.741306641127, 5750.338711048283, 5642.971785141131, 5674.602777805597, 5688.175214593861, 5703.201551782754, 5788.826335209867, 4445.2887537993765, 4457.576530229623, 4460.30865215892, 4487.4839393470165, 4506.188886000551, 3904.4338570907626, 3968.940465893014, 3984.7409918355215, 4026.53694825093, 4027.556968733437, 5389.191621256843, 5405.297311349499, 5464.153056276284, 5497.367802702661, 5513.228148059275, 5608.635438696471, 5612.130119831432, 5643.463870932255, 5651.519620832275, 5655.1517272409465, 5267.710275934784, 5335.306410166731, 5379.6234263601955, 5410.648307859977, 5422.240886275925, 4949.257611358325, 4952.975235123801, 4953.8266160684925, 4963.329950456714, 4974.030064137459, 6009.308929473079, 6025.0359942409, 6032.577719559588, 6042.909356359658, 6061.969690151521, 5677.318721753416, 5693.174489699053, 5706.087026075808, 5726.4273572642405, 5780.364159942319, 5854.151148083419, 5917.260342457193, 5923.170756094064, 5941.970290148522, 5954.7915822947725, 5598.412166722598, 5631.2960879890015, 5646.0, 5650.85872853182, 5678.20505129274, 5744.224529688606, 5788.681622510634, 5814.622049566765, 5832.504237139721, 5841.1530328101335, 5619.831405057855, 5643.097104463266, 5643.3792282848035, 5657.094864821609, 5667.574931880043, 5517.255170552085, 5579.107342825128, 5613.438656134354, 5644.068728659725, 5667.121596152603, 5451.536619387238, 5498.092814685692, 5513.2005859151, 5521.619595101225, 5534.363548192009, 5492.093804522209, 5580.107182850725, 5598.468145526169, 5629.802956896489, 5630.155476678531, 5503.559715222693, 5510.779568817203, 5546.195801608825, 5618.016847051668, 5648.181013752901], "unit": "score", "name": "dojo.html", "value": 5259.687708782646}, {"lowerIsBetter": false, "replicates": [520.1002266079681, 521.1141060197665, 525.5033992876731, 542.6255883440426, 544.0533471759136, 35374.64625353746, 35950.460743088806, 36230.63769362306, 36246.0, 36351.272974540494, 40234.19531609366, 40890.386644200364, 41159.79420102903, 41216.79391603038, 41310.0, 8499.702510412137, 8727.38908276421, 8745.43154694946, 8748.300135989106, 8757.211850933414, 8567.31461483083, 8672.60973256205, 8673.913260867374, 8697.826043479126, 8706.390552661285, 8627.396082274243, 8635.179657932518, 8688.56557172142, 8712.564371781416, 8720.912790872073, 8484.533350665712, 8659.610317535695, 8674.826503469927, 8680.175383338636, 8717.738467845975, 8572.099929507374, 8670.869936950889, 8703.47779133254, 8716.171963663443, 8733.694320698745, 38069.809650951844, 38515.0, 38618.227635447416, 38641.42037869434, 38764.41853372202, 3171.2389026633673, 3212.389645967282, 3511.262634846685, 3699.9075023124637, 4021.3766866135797, 28202.576961345596, 28459.003934862387, 29632.0, 29823.0, 30648.540271895938, 3905.1799122184375, 3958.2281455116263, 3961.1681546875193, 3982.581828907952, 4053.7567745935044, 277754.0, 283108.0, 285214.0, 286186.0, 286335.0, 42609.78695106505, 43091.7845410771, 43335.34996975048, 60559.0, 61486.0, 37680.24639507195, 38699.806500967316, 38730.0, 38808.0, 38899.61100389017, 14445.711085778226, 14600.488982885548, 14714.63213419673, 14729.189894555902, 14776.482823101354, 11681.824772628417, 11781.293122412511, 11834.289942603471, 11862.466189021514, 11900.523979040914, 14170.574882753534, 14296.0, 14321.856781432261, 14333.283335833166, 14387.0, 5752.7698892043845, 5820.097884827858, 5860.824175274749, 5864.912026319608, 5867.677277749679, 952.3095755577151, 956.4070276428658, 1045.743792770776, 1052.1687866585312, 1091.061686949223, 28585.85707071493, 28588.714112858604, 29578.260543486584, 30825.691743082283, 30889.0, 1019.8419245017034, 1026.3277553202665, 1030.1398332392537, 1076.838474228872, 1147.3402793393832, 15151.469698560497, 15374.461893833886, 15706.0, 15850.128242946748, 16070.598235044217, 189818.0, 194302.0, 195123.0, 195345.0, 195805.0, 55978.720106400026, 56187.71906140443, 56195.0, 56395.71802140963, 56615.58461038507, 1342.7918672605763, 1368.7330970460864, 1371.1224816117494, 1380.109829160186, 1414.6958403943202, 25633.743662563134, 26997.73002269952, 27469.76386062672, 27616.309592260353, 30469.23826904345, 45554.77222613866, 46462.07075858396, 46501.0, 46556.7672161637, 46606.0, 294320.0, 294686.0, 295221.0, 296515.0, 297656.0, 43664.12671746484, 43768.0, 43978.34032489451, 44047.77976110227, 44336.77831610821, 45817.312740309586, 46194.157862026106, 46442.30336544887, 47073.529264706915, 47228.291575625706, 38500.037499062746, 39522.60477395189, 39724.80137599409, 39901.80049099736, 41138.38292425676, 37917.0, 38209.4268585977, 39051.80474097611, 40054.39918401168, 40589.39115913323, 34783.652163478044, 35017.474737878445, 38581.2283754329, 39245.60754392534, 39344.60655393524, 29601.0, 30899.845500772353, 31846.0, 32025.359492809548, 32069.67930320667, 24146.75853241445, 24479.51040979206, 25610.743892561582, 25706.485870282864, 25929.092481763048], "unit": "score", "name": "ext.html", "value": 17911.802646914726}, {"lowerIsBetter": false, "replicates": [347.1841173242878, 356.47598030894574, 356.6629535089341, 364.39510412714884, 367.3809630772151, 16628.251728672207, 16827.158642067894, 17519.0, 18343.908280458614, 19068.809311906894, 10929.672109836698, 11036.282641628288, 11142.721431964184, 11161.162912781534, 11221.887781122186, 4731.077439899213, 4902.632302577321, 4926.45808961014, 4941.579965702902, 4957.107720610289, 4635.351050852883, 4831.879203019917, 4904.950950490485, 4908.141075311824, 4926.211806111023, 5015.598752099823, 5148.304978827848, 5199.038177937075, 5322.0952438085615, 5346.438623944488, 5137.229415587692, 5138.665986710889, 5160.483951604847, 5164.0, 5178.249153872686, 5265.157574788054, 5331.840044798662, 5341.706206158659, 5350.384705758848, 5366.0, 12062.939685301604, 12200.14598978063, 12279.447424865903, 12293.877061229363, 12379.0, 2043.8569300148995, 2074.834013278934, 2083.89231732403, 2393.557191919483, 2561.9359516012064, 9068.68259610917, 9213.539323033889, 9295.48874811885, 9361.29790265726, 9455.392583260793, 1810.411616224719, 1890.2816929566677, 1911.6750152474112, 2013.7684166320914, 2085.301424022954, 44601.0, 64676.676616617086, 65709.0, 66228.0, 67447.66276168588, 10399.58401663925, 10402.323848949945, 10492.895071049192, 10499.632512862014, 10566.260361774603, 13588.796168057486, 13663.521776737965, 13686.931565342109, 13786.103903246258, 13848.784194528827, 7724.6137693115115, 7863.764087077397, 7863.921360786433, 7904.723334683374, 7923.564203968837, 7686.423518236154, 7710.807229819299, 7734.497257678233, 7740.071191457061, 7791.610419479003, 4479.440069991251, 4564.954350456453, 4576.130535198368, 4585.10590434862, 4587.059652771174, 1714.1257958441035, 1771.4774141627993, 1777.9111044447725, 1796.6316905034437, 1798.8740788144705, 868.2055918834196, 934.1265916368218, 963.4171326347599, 1003.5283416794096, 1085.1264731890903, 15711.68576628484, 16126.677466450605, 16760.245788939283, 17145.82854171442, 17185.91407042982, 906.8367693815045, 922.280621115531, 938.9859152112724, 946.6781294359951, 1005.2460654509118, 9578.712638620853, 9955.25335599833, 10042.497875106215, 10205.642802501878, 10286.2799604027, 321412.0, 326417.0, 326921.0, 328400.0, 330590.0, 67570.32429675739, 68532.657336714, 69907.65046174737, 76281.23718762852, 80489.19510804935, 979.6375341123687, 1006.5973610555836, 1011.8229309870743, 1029.3875144289136, 1064.1858977881927, 15919.522414327588, 15971.12158831229, 15990.760138597698, 16022.599435014217, 16464.42374516934, 31647.208819778767, 31659.050228493183, 33022.66977330292, 34540.481892771124, 34746.478802818485, 44937.0, 47934.52065479301, 47965.76017119892, 48187.5181248183, 48730.512694874014, 7702.691892324245, 7986.720464783704, 8004.079530854026, 8044.155363686728, 8075.111737708965, 11990.220635658654, 13225.40485678166, 13260.403281852532, 13431.597052088453, 13474.124181928144, 10003.14973227284, 10079.0, 10437.373757574569, 10717.249792514449, 11321.603743868925, 11033.668989930315, 11054.834177487182, 11097.945695158947, 11257.943710281395, 11398.316101033965, 11034.668959931216, 11104.833427498432, 11197.552097916318, 11278.548858045586, 11295.548178072784, 7607.429442791923, 7783.571903545359, 7789.415793815373, 7997.600119994094, 8068.273855352812, 8917.866232006654, 10876.45617719095, 10987.450627468435, 11114.0, 11298.322100673986], "unit": "score", "name": "jquery.html", "value": 8116.1756018167935}, {"lowerIsBetter": false, "replicates": [1463.0051564935845, 1488.791569180315, 1656.2877962476139, 1749.4576681228828, 1799.064486467037, 7354.558726476408, 7525.698972041112, 7599.734009309682, 7618.466707330482, 7671.731489397872, 7721.72973945912, 7733.0, 7744.0, 7780.0, 7807.0, 2276.203328834911, 2281.087564974007, 2291.415688999303, 2292.862428254302, 2307.1694190091553, 2188.365374041526, 2325.162941341116, 2335.92992210234, 2351.964720529185, 2359.292212336301, 1981.2966396929098, 2253.4028482452163, 2317.44381348476, 2338.6141286687675, 2350.25966820451, 2214.1918199857096, 2227.4988127671227, 2227.766084561114, 2242.416971587391, 2247.101159536199, 2198.230619283254, 2259.954800903989, 2277.738060123074, 2282.783135602115, 2286.039863257436, 7604.733834315773, 7644.46488745788, 7672.616369181518, 7678.040244969379, 7688.730894418724, 4582.725036497821, 4669.182892993713, 4726.409198850144, 4746.572808447257, 4748.5251474852585, 3036.4382589221063, 3061.1734831595345, 3157.36852629475, 3172.53998170264, 3182.44307246231, 984.1487113646645, 993.7764003099317, 1014.5890914179769, 1046.8743750749882, 1047.3035431438084, 9661.275404344702, 9689.70930872075, 9834.9508252459, 9974.351667141613, 10090.243231757575, 4001.299772539794, 4019.1358857845703, 4069.084455997436, 4069.145479449349, 4086.3257562501853, 7972.60136993148, 8002.759917202493, 8039.8794018089775, 8052.5571093590415, 8054.114047454776, 4626.028534007829, 4629.213033784265, 4629.236176030917, 4629.791659375336, 4630.930536041962, 4265.914681706348, 4283.657307415461, 4292.678049146327, 4300.053988122608, 4319.460067491564, 3198.4082944655315, 3215.6302025266928, 3226.2418331692033, 3226.2902161524426, 3252.1381833814057, 1000.2548101664162, 1004.081265641944, 1005.3565717940523, 1007.0483393193362, 1011.7116621762763, 973.9318247722733, 1042.103790739963, 1053.3574519543072, 1083.566573370658, 1136.3693150301663, 7008.738427083174, 7099.219085900547, 7100.289971002859, 7156.785296441115, 7156.92843071573, 602.6354055796268, 621.1924498152384, 629.4366541945025, 631.2582715309493, 769.0463824857137, 5384.757685904144, 5413.7834486620095, 5487.2317875497465, 5523.226748255248, 5548.0845660466375, 8921.866172007425, 9158.587863546156, 9237.584308706124, 9273.0, 9316.534173291308, 9008.189262966234, 9074.637014519345, 9094.909050909539, 9250.72247832566, 9310.95344523273, 7256.6734496947765, 7299.781006569811, 7316.561006339637, 7344.889826652605, 7349.522281051822, 6937.895931561132, 6996.125484314461, 7033.577985320897, 7047.154341479055, 7059.082319298664, 8220.63007164691, 8235.95882020586, 8259.297959673495, 8320.375971802017, 8437.0, 8463.957680211559, 8483.74548763538, 8593.65625375003, 8616.61225244878, 8645.91354086451, 6327.715252813542, 6347.968260158855, 6374.0, 6417.807465776034, 6418.326075761977, 7284.490085694162, 7307.0, 7308.451866109956, 7492.962535187289, 7496.887546686913, 6572.309907459839, 6680.432163265982, 6744.763933262312, 6800.285969973082, 6840.384365407137, 6509.544331896722, 6594.70323835419, 6603.867922641616, 6692.0, 6715.597064176165, 6871.896921546081, 6938.410235130071, 6986.371226589631, 6988.545744526589, 7000.404965577983, 6425.646589437626, 6452.419282264619, 6467.320931302145, 6468.3855033771715, 6468.838279043061, 6411.102445657519, 6491.675416229265, 6517.9348206517325, 6533.640649764308, 6545.0182472629485], "unit": "score", "name": "mootools.html", "value": 4307.511611725015}, {"lowerIsBetter": false, "replicates": [331.64679616208736, 334.743920900511, 341.7214969799614, 342.5632318793538, 350.26444466620103, 6170.537209709268, 6235.0, 6239.251289845225, 6333.936660633392, 6339.8098057058305, 6229.127922090899, 6251.843703907404, 6267.655278959655, 6285.654289014103, 6326.367363263671, 4836.105320515716, 4851.466338702758, 4864.367632207808, 4882.902341953159, 4884.902301953959, 4846.0, 4879.926801097987, 4886.047220791947, 4886.731229782361, 4896.975515122419, 4838.733869637169, 4846.345743324641, 4851.22380419133, 4852.859577999185, 4863.659543831933, 4500.077484115748, 4818.734969576672, 4841.080194762983, 4842.515748425165, 4845.975770121145, 4046.7774272415004, 4048.8785336439955, 4049.2711311963835, 4050.7569545827346, 4051.2910240707756, 5878.265216847894, 5892.0, 5895.941040589582, 5896.351401345849, 5913.526917846562, 5473.233747275384, 5486.890262194774, 5494.587905907033, 5497.835064948058, 5503.697296648683, 6642.103316052319, 6662.133922590032, 6665.600063996128, 6668.066470694107, 6672.499562532829, 4517.932231016537, 4525.027119169362, 4529.796159172845, 4530.728156310632, 4539.364488971547, 6734.090897728793, 6917.27368626292, 6918.481113916426, 6920.411764999981, 6946.6179360135175, 4616.884577885579, 4627.375304333872, 4632.768361581975, 4633.957359594132, 4647.604953578916, 4661.370714953506, 4672.813087476463, 4693.577578017995, 4696.718196908197, 4712.034033023222, 5484.095124304525, 5494.5054945054335, 5504.954058728828, 5508.20131080991, 5510.035743744828, 6688.86622267552, 6693.765718199839, 6710.328967103348, 6722.798316050526, 6731.596104233761, 1578.1162548972611, 1655.2882260628046, 1661.3271624991899, 1663.517579901815, 1664.67538829927, 1066.1790421375651, 1067.2209287220373, 1080.9891901081046, 1085.316250762015, 1096.6107032003524, 6196.535259855439, 6248.781292654735, 6261.0, 6297.055441683784, 6304.621722696653, 6730.576992282774, 6780.220274668378, 6784.525083244224, 6794.626295553792, 6803.455723542104, 6273.466755325757, 6294.244690637152, 6296.842578935563, 6300.21247344082, 6320.178376810985, 3637.94543081854, 3650.233450975325, 3653.5067765851268, 3666.651668091527, 3673.2286219893585, 7106.2183159852375, 7134.714611415485, 7322.670479828314, 7327.816804579928, 7335.633218339061, 7093.255208203064, 7105.218425973138, 7107.502474826816, 7122.821929451701, 7131.429485641136, 7253.202147763742, 7254.455915806336, 7261.092363454568, 7273.163586187656, 7283.963580182065, 6920.7231710731, 6927.618980956096, 6934.653267336714, 6935.583864968118, 6940.618265995418, 6666.766663166766, 6828.487863410165, 6892.827679308058, 6894.413974812197, 6910.20532638753, 7207.675654595451, 7224.349808517259, 7231.0, 7256.96371518139, 7264.891026634499, 4645.396098507173, 4685.109829132454, 4685.976570117127, 4704.600108990774, 4708.034852855225, 6882.0, 6909.792706218822, 6912.55068420551, 6913.585184888922, 6914.654267286716, 6488.967555162194, 6706.865862682816, 6713.328667133443, 6741.157355330583, 6741.393274605309, 6692.899606506004, 6736.528443008942, 6756.358145976124, 6810.455163586802, 6817.420519255918, 6541.934580654132, 6556.246031706224, 6582.670866456562, 6586.571872828251, 6616.0, 6698.899516507159, 6714.966425167843, 6715.899261510984, 6718.798436046926, 6721.798346049626, 6366.713497892513, 6582.506312026521, 6587.538872278895, 6616.305287944697, 6634.83412914681], "unit": "score", "name": "prototype.html", "value": 5005.543145787847}, {"lowerIsBetter": false, "replicates": [687.845234822165, 787.4055088408247, 787.8975733154691, 789.9565523896183, 802.0896282719116, 12448.688782780424, 12699.365031748423, 12701.174423662467, 12717.17338373005, 12743.936280318609, 12944.93527532361, 12982.870171298284, 13016.869831301685, 13018.544350947719, 13056.543020994244, 809.8461292354464, 811.8985126859143, 827.210014436215, 827.5365795154732, 827.5407149032285, 819.6721311475397, 821.7370441458736, 822.0341099208437, 822.5352675738188, 830.8047608811925, 857.3826844671827, 859.1065292096243, 862.2627653356384, 866.1338661338661, 866.1901122450529, 850.268768858781, 857.065798279878, 857.1771099744253, 860.1226748716336, 864.0365991918997, 635.5170070746266, 636.920384951881, 637.2703254773305, 637.3626373626373, 639.3127388057857, 13350.666233344147, 13360.799588006188, 13468.124571902796, 13484.528041518597, 13486.055976081678, 12351.135420520568, 12470.625881223486, 12731.554395596202, 12761.61715148547, 12864.0, 10605.151587872951, 10628.36229826213, 10639.840402393971, 10937.781244375148, 11405.828912566318, 3621.474886141521, 3654.7624404413627, 3660.673719737775, 3774.565924918642, 3781.9054523636855, 52188.0, 52455.73772131115, 52524.21213681798, 52897.0, 53436.465635343535, 9860.605575777032, 10119.241056920613, 10122.746931326628, 10465.42440165783, 10560.735981600368, 17656.117194140497, 17852.732209016875, 17942.102894855467, 18160.18279177414, 18204.089795510172, 7600.2779735925, 7700.229977002255, 7842.960785196037, 7870.6851725931465, 7993.480423772437, 4141.6065473779945, 4170.874873753793, 4253.0, 4283.785810709514, 4467.128909862546, 2969.792114552004, 2988.2529367658085, 3002.789804713693, 3005.7144571265694, 3010.0, 591.6834493545932, 592.3040427497673, 592.5259792166249, 599.9610025348338, 617.6294223465884, 516.7390467813805, 575.4217011903095, 582.9970850145722, 611.400827189357, 641.4419455074022, 8000.679972801139, 8403.705870294632, 8472.322214222848, 8537.829243415097, 8631.91368086311, 620.512897375558, 622.3714048810643, 631.8072987738692, 637.9266384365765, 659.4526542969325, 3857.3442514772555, 3967.761934283952, 4080.224757296104, 4160.396742472324, 4180.059486615487, 60041.0, 60865.0, 61826.69086654538, 61840.0, 62105.68947155235, 52404.47595524072, 53185.0, 53230.73384633052, 53715.0, 53994.730026349614, 45653.31520027202, 47387.52612473831, 47804.76097619559, 47867.0, 48660.0, 7773.0, 8119.75640730779, 8221.753347399588, 8242.752717418487, 8325.458845175044, 34084.488732668535, 34349.96950091501, 34781.65218347885, 34973.47539786956, 35152.82423587866, 42467.1506569873, 45427.77286113548, 45661.54338456573, 45829.31256031096, 46151.53848461472, 10328.586856525655, 10363.0, 10420.739481512719, 10495.107915826935, 10519.526621302213, 11289.0, 11436.828447573127, 11448.0, 11696.122790790554, 11796.233244839059, 10207.183425326104, 10294.794104117726, 10300.278980471296, 10334.328268662513, 10477.476126193813, 10766.89233107659, 10770.353778773298, 10975.890241097486, 11103.50034248477, 11135.053520450852, 10352.378857268588, 10958.506867191156, 10964.890351096386, 10971.561137554409, 11004.339739615649, 8829.0, 8975.730728078168, 9024.458532488072, 9483.430994140374, 9555.61777528891, 8324.334053275603, 8933.41952165492, 9008.0, 9121.589528471102, 9278.304127190353], "unit": "score", "name": "yui.html", "value": 6263.4697495184455}], "name": "dromaeo_css", "value": 6849.570791559367}, {"lowerIsBetter": true, "subtests": [{"lowerIsBetter": true, "replicates": [113.0, 108.0, 115.0, 113.0, 114.0, 124.0, 115.0, 113.0, 113.0, 114.0], "unit": "score", "name": "ai-astar", "value": 114.2}, {"lowerIsBetter": true, "replicates": [153.0, 125.0, 160.0, 167.0, 127.0, 156.0, 150.0, 129.0, 181.0, 132.0], "unit": "score", "name": "audio-beat-detection", "value": 148.0}, {"lowerIsBetter": true, "replicates": [176.0, 163.0, 163.0, 164.0, 161.0, 163.0, 164.0, 173.0, 167.0, 163.0], "unit": "score", "name": "audio-dft", "value": 165.7}, {"lowerIsBetter": true, "replicates": [75.0, 78.0, 73.0, 157.0, 74.0, 74.0, 75.0, 74.0, 152.0, 74.0], "unit": "score", "name": "audio-fft", "value": 90.6}, {"lowerIsBetter": true, "replicates": [97.0, 96.0, 142.0, 96.0, 98.0, 98.0, 148.0, 96.0, 97.0, 141.0], "unit": "score", "name": "audio-oscillator", "value": 110.9}, {"lowerIsBetter": true, "replicates": [118.0, 117.0, 116.0, 116.0, 116.0, 116.0, 115.0, 117.0, 114.0, 115.0], "unit": "score", "name": "imaging-gaussian-blur", "value": 116.0}, {"lowerIsBetter": true, "replicates": [147.0, 148.0, 148.0, 148.0, 147.0, 146.0, 147.0, 147.0, 147.0, 148.0], "unit": "score", "name": "imaging-darkroom", "value": 147.3}, {"lowerIsBetter": true, "replicates": [97.0, 97.0, 97.0, 97.0, 97.0, 97.0, 97.0, 98.0, 97.0, 97.0], "unit": "score", "name": "imaging-desaturate", "value": 97.1}, {"lowerIsBetter": true, "replicates": [59.0, 59.0, 58.0, 59.0, 61.0, 60.0, 57.0, 70.0, 58.0, 57.0], "unit": "score", "name": "json-parse-financial", "value": 59.8}, {"lowerIsBetter": true, "replicates": [68.0, 67.0, 69.0, 68.0, 68.0, 72.0, 72.0, 68.0, 69.0, 68.0], "unit": "score", "name": "json-stringify-tinderbox", "value": 68.9}, {"lowerIsBetter": true, "replicates": [83.0, 84.0, 84.0, 84.0, 93.0, 84.0, 87.0, 84.0, 85.0, 84.0], "unit": "score", "name": "stanford-crypto-aes", "value": 85.2}, {"lowerIsBetter": true, "replicates": [118.0, 132.0, 131.0, 116.0, 123.0, 127.0, 116.0, 119.0, 130.0, 122.0], "unit": "score", "name": "stanford-crypto-ccm", "value": 123.4}, {"lowerIsBetter": true, "replicates": [154.0, 160.0, 154.0, 158.0, 152.0, 141.0, 153.0, 151.0, 158.0, 141.0], "unit": "score", "name": "stanford-crypto-pbkdf2", "value": 152.2}, {"lowerIsBetter": true, "replicates": [72.0, 70.0, 74.0, 71.0, 77.0, 67.0, 68.0, 71.0, 68.0, 70.0], "unit": "score", "name": "stanford-crypto-sha256-iterative", "value": 70.8}], "name": "kraken", "value": 1550.1000000000004}]} 08:20:00 INFO - TinderboxPrint: TalosResult: {"graphserver": {"kraken": {"url": "http://graphs.mozilla.org/graph.html#tests=[[232,64,43]]", "result": "1550.10"}, "dromaeo_css": {"url": "http://graphs.mozilla.org/graph.html#tests=[[72,64,43]]", "result": "6849.57"}}} 08:20:00 INFO - Return code: 0 08:20:00 INFO - Validating PERFHERDER_DATA against /builds/slave/test-pgo/build/tests/talos/treeherder-schemas/performance-artifact.json 08:20:00 ERROR - # TBPL SUCCESS # 08:20:00 INFO - Running post-action listener: _resource_record_post_action 08:20:00 INFO - Running post-run listener: _resource_record_post_run 08:20:01 INFO - Total resource usage - Wall time: 1188s; CPU: 13.0%; Read bytes: 0; Write bytes: 539885568; Read time: 0; Write time: 469572 08:20:01 INFO - install - Wall time: 17s; CPU: 14.0%; Read bytes: 0; Write bytes: 240668672; Read time: 0; Write time: 264940 08:20:01 INFO - run-tests - Wall time: 1172s; CPU: 13.0%; Read bytes: 0; Write bytes: 299024384; Read time: 0; Write time: 204608 08:20:01 INFO - Running post-run listener: _upload_blobber_files 08:20:01 INFO - Blob upload gear active. 08:20:01 INFO - Preparing to upload files from /builds/slave/test-pgo/build/blobber_upload_dir. 08:20:01 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 08:20:01 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'] 08:20:01 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 08:20:02 INFO - (blobuploader) - INFO - Open directory for files ... 08:20:02 INFO - (blobuploader) - INFO - Uploading /builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs-e10s_raw.log ... 08:20:02 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 08:20:02 INFO - (blobuploader) - INFO - Uploading, attempt #1. 08:20:03 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_raw.log: uploaded 08:20:03 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 08:20:03 INFO - (blobuploader) - INFO - Done attempting. 08:20:03 INFO - (blobuploader) - INFO - Uploading /builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log ... 08:20:03 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 08:20:03 INFO - (blobuploader) - INFO - Uploading, attempt #1. 08:20:04 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_errorsummary.log: uploaded 08:20:04 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 08:20:04 INFO - (blobuploader) - INFO - Done attempting. 08:20:04 INFO - (blobuploader) - INFO - Iteration through files over. 08:20:04 INFO - Return code: 0 08:20:04 INFO - rmtree: /builds/slave/test-pgo/build/uploaded_files.json 08:20:04 INFO - retry: Calling remove with args: ('/builds/slave/test-pgo/build/uploaded_files.json',), kwargs: {}, attempt #1 08:20:04 INFO - Setting buildbot property blobber_files to {"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/ad403f8659514b152fcbd0b6e9f423639ec78312fbd7c5a21b74c857eff2f713f887b92d918e5f04ec23dd331b1d681cca638025bf951329175719e17e09f007", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/fc8252e7edf36e124cb7cd2ae978246920ef650af48f961dae171a37e921d0547bb2d0a2e31503edd8484fb8dbe8dadf8d89fdda1e77e49b512cc2e1d7021f53"} 08:20:04 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test-pgo/properties/blobber_files 08:20:04 INFO - Writing to file /builds/slave/test-pgo/properties/blobber_files 08:20:04 INFO - Contents: 08:20:04 INFO - blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/ad403f8659514b152fcbd0b6e9f423639ec78312fbd7c5a21b74c857eff2f713f887b92d918e5f04ec23dd331b1d681cca638025bf951329175719e17e09f007", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/fc8252e7edf36e124cb7cd2ae978246920ef650af48f961dae171a37e921d0547bb2d0a2e31503edd8484fb8dbe8dadf8d89fdda1e77e49b512cc2e1d7021f53"} 08:20:04 INFO - Running post-run listener: copy_logs_to_upload_dir 08:20:04 INFO - Copying logs to upload dir... 08:20:04 INFO - mkdir: /builds/slave/test-pgo/build/upload/logs 08:20:04 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1243.464120 ========= master_lag: 0.01 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 43 secs) (at 2016-02-22 08:20:04.022741) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-02-22 08:20:04.026366) ========= 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=1f5564757af27664ca02d71f000001b0-1456154404.465151-1259195796 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/ad403f8659514b152fcbd0b6e9f423639ec78312fbd7c5a21b74c857eff2f713f887b92d918e5f04ec23dd331b1d681cca638025bf951329175719e17e09f007", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/fc8252e7edf36e124cb7cd2ae978246920ef650af48f961dae171a37e921d0547bb2d0a2e31503edd8484fb8dbe8dadf8d89fdda1e77e49b512cc2e1d7021f53"} build_url:https://queue.taskcluster.net/v1/task/FB_X6UOKR9ioux6Ne_VENA/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.011403 build_url: 'https://queue.taskcluster.net/v1/task/FB_X6UOKR9ioux6Ne_VENA/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2' blobber_files: '{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/ad403f8659514b152fcbd0b6e9f423639ec78312fbd7c5a21b74c857eff2f713f887b92d918e5f04ec23dd331b1d681cca638025bf951329175719e17e09f007", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/fc8252e7edf36e124cb7cd2ae978246920ef650af48f961dae171a37e921d0547bb2d0a2e31503edd8484fb8dbe8dadf8d89fdda1e77e49b512cc2e1d7021f53"}' ========= master_lag: 0.01 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-02-22 08:20:04.050898) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-02-22 08:20:04.051220) ========= 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=1f5564757af27664ca02d71f000001b0-1456154404.465151-1259195796 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004859 ========= master_lag: 0.05 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-02-22 08:20:04.102616) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-02-22 08:20:04.102918) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-02-22 08:20:04.103182) ========= ========= Total master_lag: 0.25 =========