builder: mozilla-central_ubuntu64_hw_test-dromaeojs-pgo slave: talos-linux64-ix-013 starttime: 1456251401.53 results: success (0) buildid: 20160223030304 builduid: d32a9238d9644683b7ce63ab094970b9 revision: 789a12291942763bc1e3a89f97e0b82dc1c9d00b ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-02-23 10:16:41.532200) ========= master: http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-02-23 10:16:41.532712) ========= ========= Started set props: basedir (results: 0, elapsed: 0 secs) (at 2016-02-23 10:16:41.533043) ========= 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=9c3a94c35cc88655b05d2c08000001b2-1456251229.294312-1288659091 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False /builds/slave/test-pgo program finished with exit code 0 elapsedTime=0.006676 basedir: '/builds/slave/test-pgo' ========= master_lag: 0.04 ========= ========= Finished set props: basedir (results: 0, elapsed: 0 secs) (at 2016-02-23 10:16:41.582363) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-02-23 10:16:41.582714) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-02-23 10:16:41.645537) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-02-23 10:16:41.645930) ========= 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=9c3a94c35cc88655b05d2c08000001b2-1456251229.294312-1288659091 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004566 ========= master_lag: 0.06 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-02-23 10:16:41.714709) ========= ========= Started set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2016-02-23 10:16:41.715078) ========= script_repo_url: https://hg.mozilla.org/build/mozharness ========= Finished set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2016-02-23 10:16:41.715574) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-02-23 10:16:41.715904) ========= 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=9c3a94c35cc88655b05d2c08000001b2-1456251229.294312-1288659091 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2016-02-23 10:16:41-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org (hg.mozilla.org)... 63.245.215.102, 63.245.215.25 Connecting to hg.mozilla.org (hg.mozilla.org)|63.245.215.102|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12141 (12K) [text/x-python] Saving to: `archiver_client.py' 0K .......... . 100% 226M=0s 2016-02-23 10:16:41 (226 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.097979 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-02-23 10:16:41.838016) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-02-23 10:16:41.838429) ========= 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=9c3a94c35cc88655b05d2c08000001b2-1456251229.294312-1288659091 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.022186 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-02-23 10:16:41.888800) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-02-23 10:16:41.889235) ========= bash -c 'python archiver_client.py mozharness --repo mozilla-central --rev 789a12291942763bc1e3a89f97e0b82dc1c9d00b --destination scripts --debug' in dir /builds/slave/test-pgo/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', u'python archiver_client.py mozharness --repo mozilla-central --rev 789a12291942763bc1e3a89f97e0b82dc1c9d00b --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=9c3a94c35cc88655b05d2c08000001b2-1456251229.294312-1288659091 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2016-02-23 10:16:42,002 truncating revision to first 12 chars 2016-02-23 10:16:42,002 Setting DEBUG logging. 2016-02-23 10:16:42,002 attempt 1/10 2016-02-23 10:16:42,002 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/mozilla-central/789a12291942?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-02-23 10:16:42,283 unpacking tar archive at: mozilla-central-789a12291942/testing/mozharness/ program finished with exit code 0 elapsedTime=0.593965 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-02-23 10:16:42.499199) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-02-23 10:16:42.499554) ========= echo 789a12291942763bc1e3a89f97e0b82dc1c9d00b in dir /builds/slave/test-pgo/. (timeout 1200 secs) watching logfiles {} argv: ['echo', u'789a12291942763bc1e3a89f97e0b82dc1c9d00b'] 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=9c3a94c35cc88655b05d2c08000001b2-1456251229.294312-1288659091 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 789a12291942763bc1e3a89f97e0b82dc1c9d00b program finished with exit code 0 elapsedTime=0.004301 script_repo_revision: '789a12291942763bc1e3a89f97e0b82dc1c9d00b' ========= master_lag: 0.04 ========= ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-02-23 10:16:42.548581) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-02-23 10:16:42.548963) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-02-23 10:16:42.560339) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 45 secs) (at 2016-02-23 10:16:42.560682) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Firefox --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Firefox in dir /builds/slave/test-pgo/. (timeout 3600 secs) (maxTime 7200 secs) watching logfiles {} argv: ['/tools/buildbot/bin/python', 'scripts/scripts/talos_script.py', '--suite', 'dromaeojs', '--add-option', '--webServer,localhost', '--branch-name', 'Firefox', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Firefox'] 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=9c3a94c35cc88655b05d2c08000001b2-1456251229.294312-1288659091 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 10:16:42 INFO - MultiFileLogger online at 20160223 10:16:42 in /builds/slave/test-pgo 10:16:42 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Firefox --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Firefox 10:16:42 INFO - Dumping config to /builds/slave/test-pgo/logs/localconfig.json. 10:16:42 INFO - {'append_to_log': False, 10:16:42 INFO - 'base_work_dir': '/builds/slave/test-pgo', 10:16:42 INFO - 'blob_upload_branch': 'Firefox', 10:16:42 INFO - 'blob_uploader_auth_file': '/builds/slave/test-pgo/oauth.txt', 10:16:42 INFO - 'branch': 'Firefox', 10:16:42 INFO - 'buildbot_json_path': 'buildprops.json', 10:16:42 INFO - 'config_files': ('talos/linux_config.py',), 10:16:42 INFO - 'default_actions': ('clobber', 10:16:42 INFO - 'read-buildbot-config', 10:16:42 INFO - 'download-and-extract', 10:16:42 INFO - 'populate-webroot', 10:16:42 INFO - 'create-virtualenv', 10:16:42 INFO - 'install', 10:16:42 INFO - 'run-tests'), 10:16:42 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 10:16:42 INFO - 'download_minidump_stackwalk': True, 10:16:42 INFO - 'download_symbols': 'ondemand', 10:16:42 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 10:16:42 INFO - 'tooltool.py': '/tools/tooltool.py', 10:16:42 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 10:16:42 INFO - '/tools/misc-python/virtualenv.py')}, 10:16:42 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 10:16:42 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 10:16:42 INFO - 'installer_path': 'installer.exe', 10:16:42 INFO - 'log_level': 'info', 10:16:42 INFO - 'log_name': 'talos', 10:16:42 INFO - 'log_to_console': True, 10:16:42 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 10:16:42 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 10:16:42 INFO - 'opt_config_files': (), 10:16:42 INFO - 'pip_index': False, 10:16:42 INFO - 'sps_profile': False, 10:16:42 INFO - 'sps_profile_interval': 0, 10:16:42 INFO - 'suite': 'dromaeojs', 10:16:42 INFO - 'system_bits': '32', 10:16:42 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 10:16:42 INFO - 'title': 'talos-linux64-ix-013', 10:16:42 INFO - 'tooltool_cache': '/builds/tooltool_cache', 10:16:42 INFO - 'use_talos_json': True, 10:16:42 INFO - 'virtualenv_path': '/builds/slave/test-pgo/build/venv', 10:16:42 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 10:16:42 INFO - 'work_dir': 'build'} 10:16:42 INFO - ##### 10:16:42 INFO - ##### Running clobber step. 10:16:42 INFO - ##### 10:16:42 INFO - Running pre-action listener: _resource_record_pre_action 10:16:42 INFO - Running main action method: clobber 10:16:42 INFO - rmtree: /builds/slave/test-pgo/build 10:16:42 INFO - retry: Calling rmtree with args: ('/builds/slave/test-pgo/build',), kwargs: {}, attempt #1 10:16:43 INFO - Running post-action listener: _resource_record_post_action 10:16:43 INFO - ##### 10:16:43 INFO - ##### Running read-buildbot-config step. 10:16:43 INFO - ##### 10:16:43 INFO - Running pre-action listener: _resource_record_pre_action 10:16:43 INFO - Running main action method: read_buildbot_config 10:16:43 INFO - Using buildbot properties: 10:16:43 INFO - { 10:16:43 INFO - "project": "", 10:16:43 INFO - "product": "firefox", 10:16:43 INFO - "script_repo_revision": "production", 10:16:43 INFO - "builddir": "mozilla-central_ubuntu64_hw_test-dromaeojs", 10:16:43 INFO - "repository": "", 10:16:43 INFO - "buildername": "Ubuntu HW 12.04 x64 mozilla-central pgo talos dromaeojs", 10:16:43 INFO - "buildid": "20160223030304", 10:16:43 INFO - "stage_platform": "linux64-pgo", 10:16:43 INFO - "basedir": "/builds/slave/test-pgo", 10:16:43 INFO - "nightly_build": "True", 10:16:43 INFO - "buildnumber": 359, 10:16:43 INFO - "slavename": "talos-linux64-ix-013", 10:16:43 INFO - "master": "http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/", 10:16:43 INFO - "platform": "ubuntu64_hw", 10:16:43 INFO - "scheduler": "tests-mozilla-central-linux64-pgo-talos", 10:16:43 INFO - "branch": "mozilla-central", 10:16:43 INFO - "repo_path": "mozilla-central", 10:16:43 INFO - "revision": "789a12291942763bc1e3a89f97e0b82dc1c9d00b", 10:16:43 INFO - "pgo_build": "True", 10:16:43 INFO - "builduid": "d32a9238d9644683b7ce63ab094970b9", 10:16:43 INFO - "slavebuilddir": "test" 10:16:43 INFO - } 10:16:43 INFO - Found installer url https://queue.taskcluster.net/v1/task/F3L9o7a4RkGm4govaunquA/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2. 10:16:43 INFO - Running post-action listener: _resource_record_post_action 10:16:43 INFO - ##### 10:16:43 INFO - ##### Running download-and-extract step. 10:16:43 INFO - ##### 10:16:43 INFO - Running pre-action listener: _resource_record_pre_action 10:16:43 INFO - Running main action method: download_and_extract 10:16:43 INFO - mkdir: /builds/slave/test-pgo/build/tests 10:16:43 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 10:16:43 INFO - https://queue.taskcluster.net/v1/task/F3L9o7a4RkGm4govaunquA/artifacts/public/build/test_packages.json matches https://queue.taskcluster.net 10:16:43 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/F3L9o7a4RkGm4govaunquA/artifacts/public/build/test_packages.json 10:16:43 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/F3L9o7a4RkGm4govaunquA/artifacts/public/build/test_packages.json 10:16:43 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/F3L9o7a4RkGm4govaunquA/artifacts/public/build/test_packages.json to /builds/slave/test-pgo/build/test_packages.json 10:16:43 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/F3L9o7a4RkGm4govaunquA/artifacts/public/build/test_packages.json', 'file_name': '/builds/slave/test-pgo/build/test_packages.json'}, attempt #1 10:16:46 INFO - Downloaded 1448 bytes. 10:16:46 INFO - Reading from file /builds/slave/test-pgo/build/test_packages.json 10:16:46 INFO - Using the following test package requirements: 10:16:46 INFO - {u'common': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip'], 10:16:46 INFO - u'cppunittest': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 10:16:46 INFO - u'firefox-47.0a1.en-US.linux-x86_64.cppunittest.tests.zip'], 10:16:46 INFO - u'gtest': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 10:16:46 INFO - u'firefox-47.0a1.en-US.linux-x86_64.gtest.tests.zip'], 10:16:46 INFO - u'jittest': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 10:16:46 INFO - u'jsshell-linux-x86_64.zip'], 10:16:46 INFO - u'mochitest': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 10:16:46 INFO - u'firefox-47.0a1.en-US.linux-x86_64.mochitest.tests.zip'], 10:16:46 INFO - u'mozbase': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip'], 10:16:46 INFO - u'reftest': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 10:16:46 INFO - u'firefox-47.0a1.en-US.linux-x86_64.reftest.tests.zip'], 10:16:46 INFO - u'talos': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 10:16:46 INFO - u'firefox-47.0a1.en-US.linux-x86_64.talos.tests.zip'], 10:16:46 INFO - u'web-platform': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 10:16:46 INFO - u'firefox-47.0a1.en-US.linux-x86_64.web-platform.tests.zip'], 10:16:46 INFO - u'webapprt': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip'], 10:16:46 INFO - u'xpcshell': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 10:16:46 INFO - u'firefox-47.0a1.en-US.linux-x86_64.xpcshell.tests.zip']} 10:16:46 INFO - Downloading packages: [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 10:16: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')]} 10:16:46 INFO - https://queue.taskcluster.net/v1/task/F3L9o7a4RkGm4govaunquA/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 10:16:46 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/F3L9o7a4RkGm4govaunquA/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip 10:16:46 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/F3L9o7a4RkGm4govaunquA/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip 10:16:46 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/F3L9o7a4RkGm4govaunquA/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 10:16:46 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/F3L9o7a4RkGm4govaunquA/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 10:16:55 INFO - Downloaded 23365443 bytes. 10:16:55 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'] 10:16:55 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 10:16:57 INFO - Return code: 0 10:16:57 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 10:16:57 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 10:16:57 INFO - https://queue.taskcluster.net/v1/task/F3L9o7a4RkGm4govaunquA/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 10:16:57 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/F3L9o7a4RkGm4govaunquA/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip 10:16:57 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/F3L9o7a4RkGm4govaunquA/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip 10:16:57 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/F3L9o7a4RkGm4govaunquA/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 10:16:57 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/F3L9o7a4RkGm4govaunquA/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 10:16:58 INFO - Downloaded 23365443 bytes. 10:16:58 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'] 10:16:58 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 10:17:00 INFO - Return code: 0 10:17:00 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 10:17:00 INFO - https://queue.taskcluster.net/v1/task/F3L9o7a4RkGm4govaunquA/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.talos.tests.zip matches https://queue.taskcluster.net 10:17:00 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/F3L9o7a4RkGm4govaunquA/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.talos.tests.zip 10:17:00 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/F3L9o7a4RkGm4govaunquA/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.talos.tests.zip 10:17:00 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/F3L9o7a4RkGm4govaunquA/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 10:17:00 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/F3L9o7a4RkGm4govaunquA/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 10:17:01 INFO - Downloaded 10707015 bytes. 10:17:01 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'] 10:17:01 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 10:17:01 INFO - Return code: 0 10:17:01 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 10:17:01 INFO - https://queue.taskcluster.net/v1/task/F3L9o7a4RkGm4govaunquA/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2 matches https://queue.taskcluster.net 10:17:01 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/F3L9o7a4RkGm4govaunquA/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2 10:17:01 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/F3L9o7a4RkGm4govaunquA/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2 10:17:01 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/F3L9o7a4RkGm4govaunquA/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 10:17:01 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/F3L9o7a4RkGm4govaunquA/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 10:17:03 INFO - Downloaded 56560470 bytes. 10:17:03 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/F3L9o7a4RkGm4govaunquA/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2 10:17:03 INFO - mkdir: /builds/slave/test-pgo/properties 10:17:03 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test-pgo/properties/build_url 10:17:03 INFO - Writing to file /builds/slave/test-pgo/properties/build_url 10:17:03 INFO - Contents: 10:17:03 INFO - build_url:https://queue.taskcluster.net/v1/task/F3L9o7a4RkGm4govaunquA/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2 10:17:03 INFO - Running post-action listener: _resource_record_post_action 10:17:03 INFO - Running post-action listener: set_extra_try_arguments 10:17:03 INFO - ##### 10:17:03 INFO - ##### Running populate-webroot step. 10:17:03 INFO - ##### 10:17:03 INFO - Running pre-action listener: _resource_record_pre_action 10:17:03 INFO - Running main action method: populate_webroot 10:17:03 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 10:17:03 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 10:17:03 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 10:17:03 INFO - '--tppagecycles', 10:17:03 INFO - '7'], 10:17:03 INFO - 'tests': ['tsvgm']}}, 10:17:03 INFO - 'suites': {'chromez': {'tests': ['tresize', 'tcanvasmark']}, 10:17:03 INFO - 'chromez-e10s': {'talos_options': ['--e10s'], 10:17:03 INFO - 'tests': ['tresize', 'tcanvasmark']}, 10:17:03 INFO - 'dromaeojs': {'tests': ['dromaeo_css', 'kraken']}, 10:17:03 INFO - 'dromaeojs-e10s': {'talos_options': ['--e10s'], 10:17:03 INFO - 'tests': ['dromaeo_css', 'kraken']}, 10:17:03 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 10:17:03 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 10:17:03 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 10:17:03 INFO - 'talos_options': ['--e10s'], 10:17:03 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 10:17:03 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 10:17:03 INFO - 'tests': ['damp', 'tps']}, 10:17:03 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 10:17:03 INFO - 'talos_options': ['--e10s'], 10:17:03 INFO - 'tests': ['damp', 'tps']}, 10:17:03 INFO - 'g3': {'tests': ['dromaeo_dom']}, 10:17:03 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 10:17:03 INFO - 'other': {'tests': ['a11yr', 10:17:03 INFO - 'ts_paint', 10:17:03 INFO - 'tpaint', 10:17:03 INFO - 'sessionrestore', 10:17:03 INFO - 'sessionrestore_no_auto_restore']}, 10:17:03 INFO - 'other-e10s': {'talos_options': ['--e10s'], 10:17:03 INFO - 'tests': ['a11yr', 10:17:03 INFO - 'ts_paint', 10:17:03 INFO - 'tpaint', 10:17:03 INFO - 'sessionrestore', 10:17:03 INFO - 'sessionrestore_no_auto_restore']}, 10:17:03 INFO - 'other-e10s_l64': {'talos_options': ['--e10s'], 10:17:03 INFO - 'tests': ['a11yr', 10:17:03 INFO - 'ts_paint', 10:17:03 INFO - 'tpaint', 10:17:03 INFO - 'sessionrestore', 10:17:03 INFO - 'sessionrestore_no_auto_restore']}, 10:17:03 INFO - 'other-e10s_nol64': {'talos_options': ['--e10s'], 10:17:03 INFO - 'tests': ['a11yr', 10:17:03 INFO - 'ts_paint', 10:17:03 INFO - 'tpaint', 10:17:03 INFO - 'sessionrestore', 10:17:03 INFO - 'sessionrestore_no_auto_restore']}, 10:17:03 INFO - 'other_l64': {'tests': ['a11yr', 10:17:03 INFO - 'ts_paint', 10:17:03 INFO - 'tpaint', 10:17:03 INFO - 'sessionrestore', 10:17:03 INFO - 'sessionrestore_no_auto_restore']}, 10:17:03 INFO - 'other_nol64': {'tests': ['a11yr', 10:17:03 INFO - 'ts_paint', 10:17:03 INFO - 'tpaint', 10:17:03 INFO - 'sessionrestore', 10:17:03 INFO - 'sessionrestore_no_auto_restore']}, 10:17:03 INFO - 'svgr': {'tests': ['tsvgx', 10:17:03 INFO - 'tsvgr_opacity', 10:17:03 INFO - 'tart', 10:17:03 INFO - 'tscrollx', 10:17:03 INFO - 'cart']}, 10:17:03 INFO - 'svgr-e10s': {'talos_options': ['--e10s'], 10:17:03 INFO - 'tests': ['tsvgx', 10:17:03 INFO - 'tsvgr_opacity', 10:17:03 INFO - 'tart', 10:17:03 INFO - 'tscrollx', 10:17:03 INFO - 'cart']}, 10:17:03 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 10:17:03 INFO - 'tests': ['tp5o']}, 10:17:03 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 10:17:03 INFO - 'talos_options': ['--e10s'], 10:17:03 INFO - 'tests': ['tp5o']}, 10:17:03 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 10:17:03 INFO - 'talos_options': ['--xperf_path', 10:17:03 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 10:17:03 INFO - 'tests': ['tp5n']}, 10:17:03 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 10:17:03 INFO - 'talos_options': ['--e10s', 10:17:03 INFO - '--xperf_path', 10:17:03 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 10:17:03 INFO - 'tests': ['tp5n']}}, 10:17:03 INFO - 'talos.zip': {'path': '', 10:17:03 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 10:17:03 INFO - Running post-action listener: _resource_record_post_action 10:17:03 INFO - ##### 10:17:03 INFO - ##### Running create-virtualenv step. 10:17:03 INFO - ##### 10:17:03 INFO - Running pre-action listener: _resource_record_pre_action 10:17:03 INFO - Running main action method: create_virtualenv 10:17:03 INFO - Creating virtualenv /builds/slave/test-pgo/build/venv 10:17:03 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 10:17:03 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test-pgo/build/venv 10:17:03 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 10:17:03 INFO - Using real prefix '/usr' 10:17:03 INFO - New python executable in /builds/slave/test-pgo/build/venv/bin/python 10:17:04 INFO - Installing distribute.............................................................................................................................................................................................done. 10:17:06 INFO - Installing pip.................done. 10:17:06 INFO - Return code: 0 10:17:06 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test-pgo/build/venv 10:17: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')]} 10:17:06 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:17:06 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:17: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')]} 10:17:06 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:17:06 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:17: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', 'pip>=1.5']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f9318006f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2ac08a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2b8d670>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2c1c8c0>, '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 0x2c1d7c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2c1dc50>, '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': '9c3a94c35cc88655b05d2c08000001b2-1456251229.294312-1288659091', '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 10:17: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', 'pip>=1.5'] in /builds/slave/test-pgo/build 10:17: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 pip>=1.5 10:17:06 INFO - Using env: {'DISPLAY': ':0', 10:17:06 INFO - 'HOME': '/home/cltbld', 10:17:06 INFO - 'LANG': 'en_US.UTF-8', 10:17:06 INFO - 'LANGUAGE': 'en_US:en', 10:17:06 INFO - 'LOGNAME': 'cltbld', 10:17:06 INFO - 'MAIL': '/var/mail/cltbld', 10:17:06 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:17:06 INFO - 'MOZ_NO_REMOTE': '1', 10:17:06 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 10:17:06 INFO - 'NO_EM_RESTART': '1', 10:17:06 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 10:17:06 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 10:17:06 INFO - 'PWD': '/builds/slave/test-pgo', 10:17:06 INFO - 'SHELL': '/bin/bash', 10:17:06 INFO - 'SHLVL': '1', 10:17:06 INFO - 'TERM': 'linux', 10:17:06 INFO - 'TMOUT': '86400', 10:17:06 INFO - 'USER': 'cltbld', 10:17:06 INFO - 'XDG_SESSION_COOKIE': '9c3a94c35cc88655b05d2c08000001b2-1456251229.294312-1288659091', 10:17:06 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:17:06 INFO - '_': '/tools/buildbot/bin/python'} 10:17:06 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:17:06 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 10:17:06 INFO - Cleaning up... 10:17:06 INFO - Return code: 0 10:17:06 INFO - Installing psutil>=0.7.1 into virtualenv /builds/slave/test-pgo/build/venv 10:17: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')]} 10:17:06 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:17:06 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:17: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')]} 10:17:06 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:17:06 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:17: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', '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 0x7f9318006f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2ac08a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2b8d670>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2c1c8c0>, '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 0x2c1d7c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2c1dc50>, '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': '9c3a94c35cc88655b05d2c08000001b2-1456251229.294312-1288659091', '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 10:17: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', 'psutil>=0.7.1'] in /builds/slave/test-pgo/build 10:17: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 psutil>=0.7.1 10:17:06 INFO - Using env: {'DISPLAY': ':0', 10:17:06 INFO - 'HOME': '/home/cltbld', 10:17:06 INFO - 'LANG': 'en_US.UTF-8', 10:17:06 INFO - 'LANGUAGE': 'en_US:en', 10:17:06 INFO - 'LOGNAME': 'cltbld', 10:17:06 INFO - 'MAIL': '/var/mail/cltbld', 10:17:06 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:17:06 INFO - 'MOZ_NO_REMOTE': '1', 10:17:06 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 10:17:06 INFO - 'NO_EM_RESTART': '1', 10:17:06 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 10:17:06 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 10:17:06 INFO - 'PWD': '/builds/slave/test-pgo', 10:17:06 INFO - 'SHELL': '/bin/bash', 10:17:06 INFO - 'SHLVL': '1', 10:17:06 INFO - 'TERM': 'linux', 10:17:06 INFO - 'TMOUT': '86400', 10:17:06 INFO - 'USER': 'cltbld', 10:17:06 INFO - 'XDG_SESSION_COOKIE': '9c3a94c35cc88655b05d2c08000001b2-1456251229.294312-1288659091', 10:17:06 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:17:06 INFO - '_': '/tools/buildbot/bin/python'} 10:17:06 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:17:06 INFO - Downloading/unpacking psutil>=0.7.1 10:17:06 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:17:06 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:17:06 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:17:06 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:17:06 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:17:06 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:17:08 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/psutil/setup.py) egg_info for package psutil 10:17:08 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 10:17:08 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 10:17:08 INFO - Installing collected packages: psutil 10:17:08 INFO - Running setup.py install for psutil 10:17:08 INFO - building 'psutil._psutil_linux' extension 10:17:08 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 10:17:08 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 10:17:08 INFO - building 'psutil._psutil_posix' extension 10:17:08 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 10:17:09 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 10:17:09 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 10:17:09 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 10:17:09 INFO - Successfully installed psutil 10:17:09 INFO - Cleaning up... 10:17:09 INFO - Return code: 0 10:17:09 INFO - Installing mozsystemmonitor==0.0.0 into virtualenv /builds/slave/test-pgo/build/venv 10:17: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')]} 10:17:09 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:17:09 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:17: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')]} 10:17:09 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:17:09 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:17: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', '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 0x7f9318006f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2ac08a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2b8d670>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2c1c8c0>, '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 0x2c1d7c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2c1dc50>, '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': '9c3a94c35cc88655b05d2c08000001b2-1456251229.294312-1288659091', '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 10:17: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', 'mozsystemmonitor==0.0.0'] in /builds/slave/test-pgo/build 10:17: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 mozsystemmonitor==0.0.0 10:17:09 INFO - Using env: {'DISPLAY': ':0', 10:17:09 INFO - 'HOME': '/home/cltbld', 10:17:09 INFO - 'LANG': 'en_US.UTF-8', 10:17:09 INFO - 'LANGUAGE': 'en_US:en', 10:17:09 INFO - 'LOGNAME': 'cltbld', 10:17:09 INFO - 'MAIL': '/var/mail/cltbld', 10:17:09 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:17:09 INFO - 'MOZ_NO_REMOTE': '1', 10:17:09 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 10:17:09 INFO - 'NO_EM_RESTART': '1', 10:17:09 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 10:17:09 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 10:17:09 INFO - 'PWD': '/builds/slave/test-pgo', 10:17:09 INFO - 'SHELL': '/bin/bash', 10:17:09 INFO - 'SHLVL': '1', 10:17:09 INFO - 'TERM': 'linux', 10:17:09 INFO - 'TMOUT': '86400', 10:17:09 INFO - 'USER': 'cltbld', 10:17:09 INFO - 'XDG_SESSION_COOKIE': '9c3a94c35cc88655b05d2c08000001b2-1456251229.294312-1288659091', 10:17:09 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:17:09 INFO - '_': '/tools/buildbot/bin/python'} 10:17:09 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:17:09 INFO - Downloading/unpacking mozsystemmonitor==0.0.0 10:17: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 10:17: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 10:17: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 10:17: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 10:17: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 10:17: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 10:17:11 INFO - Downloading mozsystemmonitor-0.0.tar.gz 10:17:11 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 10:17:11 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=0.7.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.0.0) 10:17:11 INFO - Installing collected packages: mozsystemmonitor 10:17:11 INFO - Running setup.py install for mozsystemmonitor 10:17:11 INFO - Successfully installed mozsystemmonitor 10:17:11 INFO - Cleaning up... 10:17:11 INFO - Return code: 0 10:17:11 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test-pgo/build/venv 10:17:11 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 10:17:11 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:17:11 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:17:11 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 10:17:11 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:17:11 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:17:11 INFO - retry: Calling run_command with args: [['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', '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 0x7f9318006f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2ac08a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2b8d670>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2c1c8c0>, '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 0x2c1d7c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2c1dc50>, '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': '9c3a94c35cc88655b05d2c08000001b2-1456251229.294312-1288659091', '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 10:17:11 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'blobuploader==1.2.4'] in /builds/slave/test-pgo/build 10:17:11 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub blobuploader==1.2.4 10:17:11 INFO - Using env: {'DISPLAY': ':0', 10:17:11 INFO - 'HOME': '/home/cltbld', 10:17:11 INFO - 'LANG': 'en_US.UTF-8', 10:17:11 INFO - 'LANGUAGE': 'en_US:en', 10:17:11 INFO - 'LOGNAME': 'cltbld', 10:17:11 INFO - 'MAIL': '/var/mail/cltbld', 10:17:11 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:17:11 INFO - 'MOZ_NO_REMOTE': '1', 10:17:11 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 10:17:11 INFO - 'NO_EM_RESTART': '1', 10:17:11 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 10:17:11 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 10:17:11 INFO - 'PWD': '/builds/slave/test-pgo', 10:17:11 INFO - 'SHELL': '/bin/bash', 10:17:11 INFO - 'SHLVL': '1', 10:17:11 INFO - 'TERM': 'linux', 10:17:11 INFO - 'TMOUT': '86400', 10:17:11 INFO - 'USER': 'cltbld', 10:17:11 INFO - 'XDG_SESSION_COOKIE': '9c3a94c35cc88655b05d2c08000001b2-1456251229.294312-1288659091', 10:17:11 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:17:11 INFO - '_': '/tools/buildbot/bin/python'} 10:17:11 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:17:11 INFO - Downloading/unpacking blobuploader==1.2.4 10:17: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 10:17: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 10:17: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 10:17: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 10:17: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 10:17: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 10:17:13 INFO - Downloading blobuploader-1.2.4.tar.gz 10:17:13 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 10:17:13 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 10:17:13 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:17:13 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:17:13 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:17:13 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:17:13 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:17:13 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:17:13 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/requests/setup.py) egg_info for package requests 10:17:13 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 10:17:13 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:17:13 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:17:13 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:17:13 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:17:13 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:17:13 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:17:14 INFO - Downloading docopt-0.6.1.tar.gz 10:17:14 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/docopt/setup.py) egg_info for package docopt 10:17:14 INFO - Installing collected packages: blobuploader, requests, docopt 10:17:14 INFO - Running setup.py install for blobuploader 10:17:14 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 10:17:14 INFO - changing mode of /builds/slave/test-pgo/build/venv/bin/blobberc.py to 775 10:17:14 INFO - Running setup.py install for requests 10:17:14 INFO - Running setup.py install for docopt 10:17:14 INFO - Successfully installed blobuploader requests docopt 10:17:14 INFO - Cleaning up... 10:17:14 INFO - Return code: 0 10:17:14 INFO - Installing None into virtualenv /builds/slave/test-pgo/build/venv 10:17:14 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')]} 10:17:14 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:17:14 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:17:14 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')]} 10:17:14 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:17:14 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:17:14 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 0x7f9318006f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2ac08a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2b8d670>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2c1c8c0>, '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 0x2c1d7c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2c1dc50>, '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': '9c3a94c35cc88655b05d2c08000001b2-1456251229.294312-1288659091', '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 10:17:14 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 10:17:14 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 10:17:14 INFO - Using env: {'DISPLAY': ':0', 10:17:14 INFO - 'HOME': '/home/cltbld', 10:17:14 INFO - 'LANG': 'en_US.UTF-8', 10:17:14 INFO - 'LANGUAGE': 'en_US:en', 10:17:14 INFO - 'LOGNAME': 'cltbld', 10:17:14 INFO - 'MAIL': '/var/mail/cltbld', 10:17:14 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:17:14 INFO - 'MOZ_NO_REMOTE': '1', 10:17:14 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 10:17:14 INFO - 'NO_EM_RESTART': '1', 10:17:14 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 10:17:14 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 10:17:14 INFO - 'PWD': '/builds/slave/test-pgo', 10:17:14 INFO - 'SHELL': '/bin/bash', 10:17:14 INFO - 'SHLVL': '1', 10:17:14 INFO - 'TERM': 'linux', 10:17:14 INFO - 'TMOUT': '86400', 10:17:14 INFO - 'USER': 'cltbld', 10:17:14 INFO - 'XDG_SESSION_COOKIE': '9c3a94c35cc88655b05d2c08000001b2-1456251229.294312-1288659091', 10:17:14 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:17:14 INFO - '_': '/tools/buildbot/bin/python'} 10:17:14 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:17:14 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/manifestparser 10:17:14 INFO - Running setup.py (path:/tmp/pip-Iz8ZOo-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/manifestparser 10:17:15 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozcrash 10:17:15 INFO - Running setup.py (path:/tmp/pip-diTsGL-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozcrash 10:17:15 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdebug 10:17:15 INFO - Running setup.py (path:/tmp/pip-oC16dE-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdebug 10:17:15 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdevice 10:17:15 INFO - Running setup.py (path:/tmp/pip-nUpToO-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdevice 10:17:15 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozfile 10:17:15 INFO - Running setup.py (path:/tmp/pip-lQwSM0-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozfile 10:17:15 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozhttpd 10:17:15 INFO - Running setup.py (path:/tmp/pip-JDBwb0-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozhttpd 10:17:15 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinfo 10:17:15 INFO - Running setup.py (path:/tmp/pip-KL_9R9-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinfo 10:17:15 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinstall 10:17:15 INFO - Running setup.py (path:/tmp/pip-5g75sa-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinstall 10:17:15 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozleak 10:17:15 INFO - Running setup.py (path:/tmp/pip-2oMG20-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozleak 10:17:15 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozlog 10:17:15 INFO - Running setup.py (path:/tmp/pip-ODEDR8-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozlog 10:17:15 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moznetwork 10:17:15 INFO - Running setup.py (path:/tmp/pip-JhWDHs-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moznetwork 10:17:15 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprocess 10:17:15 INFO - Running setup.py (path:/tmp/pip-KJzVdL-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprocess 10:17:15 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprofile 10:17:15 INFO - Running setup.py (path:/tmp/pip-soocCc-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprofile 10:17:15 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozrunner 10:17:15 INFO - Running setup.py (path:/tmp/pip-7WWCn2-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozrunner 10:17:15 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 10:17:15 INFO - Running setup.py (path:/tmp/pip-DPcO89-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 10:17:16 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moztest 10:17:16 INFO - Running setup.py (path:/tmp/pip-O8Cxt7-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moztest 10:17:16 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozversion 10:17:16 INFO - Running setup.py (path:/tmp/pip-2PwXHE-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozversion 10:17:16 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 10:17:16 INFO - Running setup.py install for manifestparser 10:17:16 INFO - Installing manifestparser script to /builds/slave/test-pgo/build/venv/bin 10:17:16 INFO - Running setup.py install for mozcrash 10:17:16 INFO - Running setup.py install for mozdebug 10:17:16 INFO - Running setup.py install for mozdevice 10:17:16 INFO - Installing sutini script to /builds/slave/test-pgo/build/venv/bin 10:17:16 INFO - Installing dm script to /builds/slave/test-pgo/build/venv/bin 10:17:16 INFO - Running setup.py install for mozfile 10:17:16 INFO - Running setup.py install for mozhttpd 10:17:16 INFO - Installing mozhttpd script to /builds/slave/test-pgo/build/venv/bin 10:17:16 INFO - Running setup.py install for mozinfo 10:17:16 INFO - Installing mozinfo script to /builds/slave/test-pgo/build/venv/bin 10:17:16 INFO - Running setup.py install for mozInstall 10:17:16 INFO - Installing moz_remove_from_system script to /builds/slave/test-pgo/build/venv/bin 10:17:16 INFO - Installing mozuninstall script to /builds/slave/test-pgo/build/venv/bin 10:17:16 INFO - Installing mozinstall script to /builds/slave/test-pgo/build/venv/bin 10:17:16 INFO - Installing moz_add_to_system script to /builds/slave/test-pgo/build/venv/bin 10:17:16 INFO - Running setup.py install for mozleak 10:17:17 INFO - Running setup.py install for mozlog 10:17:17 INFO - Installing structlog script to /builds/slave/test-pgo/build/venv/bin 10:17:17 INFO - Running setup.py install for moznetwork 10:17:17 INFO - Installing moznetwork script to /builds/slave/test-pgo/build/venv/bin 10:17:17 INFO - Running setup.py install for mozprocess 10:17:17 INFO - Running setup.py install for mozprofile 10:17:17 INFO - Installing mozprofile script to /builds/slave/test-pgo/build/venv/bin 10:17:17 INFO - Installing diff-profiles script to /builds/slave/test-pgo/build/venv/bin 10:17:17 INFO - Installing view-profile script to /builds/slave/test-pgo/build/venv/bin 10:17:17 INFO - Running setup.py install for mozrunner 10:17:17 INFO - Installing mozrunner script to /builds/slave/test-pgo/build/venv/bin 10:17:17 INFO - Running setup.py install for mozscreenshot 10:17:17 INFO - Running setup.py install for moztest 10:17:17 INFO - Running setup.py install for mozversion 10:17:17 INFO - Installing mozversion script to /builds/slave/test-pgo/build/venv/bin 10:17:17 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 10:17:17 INFO - Cleaning up... 10:17:17 INFO - Return code: 0 10:17:17 INFO - Installing None into virtualenv /builds/slave/test-pgo/build/venv 10:17:17 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')]} 10:17:17 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:17:17 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:17:17 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')]} 10:17:17 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:17:17 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:17:17 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 0x7f9318006f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2ac08a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2b8d670>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2c1c8c0>, '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 0x2c1d7c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2c1dc50>, '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': '9c3a94c35cc88655b05d2c08000001b2-1456251229.294312-1288659091', '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 10:17:17 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 10:17:17 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 10:17:17 INFO - Using env: {'DISPLAY': ':0', 10:17:17 INFO - 'HOME': '/home/cltbld', 10:17:17 INFO - 'LANG': 'en_US.UTF-8', 10:17:17 INFO - 'LANGUAGE': 'en_US:en', 10:17:17 INFO - 'LOGNAME': 'cltbld', 10:17:17 INFO - 'MAIL': '/var/mail/cltbld', 10:17:17 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:17:17 INFO - 'MOZ_NO_REMOTE': '1', 10:17:17 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 10:17:17 INFO - 'NO_EM_RESTART': '1', 10:17:17 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 10:17:17 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 10:17:17 INFO - 'PWD': '/builds/slave/test-pgo', 10:17:17 INFO - 'SHELL': '/bin/bash', 10:17:17 INFO - 'SHLVL': '1', 10:17:17 INFO - 'TERM': 'linux', 10:17:17 INFO - 'TMOUT': '86400', 10:17:17 INFO - 'USER': 'cltbld', 10:17:17 INFO - 'XDG_SESSION_COOKIE': '9c3a94c35cc88655b05d2c08000001b2-1456251229.294312-1288659091', 10:17:17 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:17:17 INFO - '_': '/tools/buildbot/bin/python'} 10:17:18 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:17:18 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/manifestparser 10:17:18 INFO - Running setup.py (path:/tmp/pip-Vq_eu_-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/manifestparser 10:17:18 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)) 10:17:18 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozcrash 10:17:18 INFO - Running setup.py (path:/tmp/pip-9ZG3NR-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozcrash 10:17:18 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)) 10:17:18 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdebug 10:17:18 INFO - Running setup.py (path:/tmp/pip-Y_QDWY-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdebug 10:17:18 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)) 10:17:18 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdevice 10:17:18 INFO - Running setup.py (path:/tmp/pip-_BgONc-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdevice 10:17:18 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)) 10:17:18 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozfile 10:17:18 INFO - Running setup.py (path:/tmp/pip-OCo8aZ-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozfile 10:17:18 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)) 10:17:18 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozhttpd 10:17:18 INFO - Running setup.py (path:/tmp/pip-2QHrhJ-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozhttpd 10:17:18 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)) 10:17:18 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinfo 10:17:18 INFO - Running setup.py (path:/tmp/pip-Ei08Zk-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinfo 10:17:18 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)) 10:17:18 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinstall 10:17:18 INFO - Running setup.py (path:/tmp/pip-Ogo4Jo-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinstall 10:17:18 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)) 10:17:18 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozleak 10:17:18 INFO - Running setup.py (path:/tmp/pip-UaroTT-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozleak 10:17:18 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)) 10:17:18 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozlog 10:17:18 INFO - Running setup.py (path:/tmp/pip-g7WDbj-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozlog 10:17:18 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)) 10:17:18 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moznetwork 10:17:18 INFO - Running setup.py (path:/tmp/pip-PfanEv-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moznetwork 10:17:18 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)) 10:17:18 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprocess 10:17:18 INFO - Running setup.py (path:/tmp/pip-uztrIB-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprocess 10:17:19 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)) 10:17:19 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprofile 10:17:19 INFO - Running setup.py (path:/tmp/pip-eqJO3y-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprofile 10:17:19 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)) 10:17:19 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozrunner 10:17:19 INFO - Running setup.py (path:/tmp/pip-F0Vw4C-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozrunner 10:17:19 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)) 10:17:19 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 10:17:19 INFO - Running setup.py (path:/tmp/pip-DGaEyM-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 10:17:19 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)) 10:17:19 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moztest 10:17:19 INFO - Running setup.py (path:/tmp/pip-BOq357-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moztest 10:17:19 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)) 10:17:19 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozversion 10:17:19 INFO - Running setup.py (path:/tmp/pip-u6066A-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozversion 10:17:19 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)) 10:17:19 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)) 10:17:19 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)) 10:17:19 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)) 10:17:19 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)) 10:17:19 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)) 10:17:19 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.1->-r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 10)) 10:17:19 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 10:17:19 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 10:17:19 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 10:17:19 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 10:17:19 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 10:17:19 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 10:17:21 INFO - Downloading blessings-1.6.tar.gz 10:17:21 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/blessings/setup.py) egg_info for package blessings 10:17:21 INFO - Installing collected packages: blessings 10:17:21 INFO - Running setup.py install for blessings 10:17:21 INFO - Successfully installed blessings 10:17:21 INFO - Cleaning up... 10:17:21 INFO - Return code: 0 10:17:21 INFO - Done creating virtualenv /builds/slave/test-pgo/build/venv. 10:17:21 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'freeze'] 10:17:21 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip freeze 10:17:21 INFO - Reading from file tmpfile_stdout 10:17:21 INFO - Current package versions: 10:17:21 INFO - argparse == 1.2.1 10:17:21 INFO - blessings == 1.6 10:17:21 INFO - blobuploader == 1.2.4 10:17:21 INFO - docopt == 0.6.1 10:17:21 INFO - manifestparser == 1.1 10:17:21 INFO - mozInstall == 1.12 10:17:21 INFO - mozcrash == 0.16 10:17:21 INFO - mozdebug == 0.1 10:17:21 INFO - mozdevice == 0.48 10:17:21 INFO - mozfile == 1.2 10:17:21 INFO - mozhttpd == 0.7 10:17:21 INFO - mozinfo == 0.9 10:17:21 INFO - mozleak == 0.1 10:17:21 INFO - mozlog == 3.1 10:17:21 INFO - moznetwork == 0.27 10:17:21 INFO - mozprocess == 0.22 10:17:21 INFO - mozprofile == 0.28 10:17:21 INFO - mozrunner == 6.11 10:17:21 INFO - mozscreenshot == 0.1 10:17:21 INFO - mozsystemmonitor == 0.0 10:17:21 INFO - moztest == 0.7 10:17:21 INFO - mozversion == 1.4 10:17:21 INFO - psutil == 3.1.1 10:17:21 INFO - requests == 1.2.3 10:17:21 INFO - wsgiref == 0.1.2 10:17:21 INFO - Installing None into virtualenv /builds/slave/test-pgo/build/venv 10:17: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')]} 10:17:21 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:17:21 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:17: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')]} 10:17:21 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:17:21 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:17:21 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 0x7f9318006f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2ac08a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2b8d670>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2c1c8c0>, '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 0x2c1d7c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2c1dc50>, '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': '9c3a94c35cc88655b05d2c08000001b2-1456251229.294312-1288659091', '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 10:17:21 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 10:17:21 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 10:17:21 INFO - Using env: {'DISPLAY': ':0', 10:17:21 INFO - 'HOME': '/home/cltbld', 10:17:21 INFO - 'LANG': 'en_US.UTF-8', 10:17:21 INFO - 'LANGUAGE': 'en_US:en', 10:17:21 INFO - 'LOGNAME': 'cltbld', 10:17:21 INFO - 'MAIL': '/var/mail/cltbld', 10:17:21 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:17:21 INFO - 'MOZ_NO_REMOTE': '1', 10:17:21 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 10:17:21 INFO - 'NO_EM_RESTART': '1', 10:17:21 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 10:17:21 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 10:17:21 INFO - 'PWD': '/builds/slave/test-pgo', 10:17:21 INFO - 'SHELL': '/bin/bash', 10:17:21 INFO - 'SHLVL': '1', 10:17:21 INFO - 'TERM': 'linux', 10:17:21 INFO - 'TMOUT': '86400', 10:17:21 INFO - 'USER': 'cltbld', 10:17:21 INFO - 'XDG_SESSION_COOKIE': '9c3a94c35cc88655b05d2c08000001b2-1456251229.294312-1288659091', 10:17:21 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:17:21 INFO - '_': '/tools/buildbot/bin/python'} 10:17:21 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:17:21 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)) 10:17:21 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)) 10:17:21 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)) 10:17:21 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)) 10:17:21 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)) 10:17:21 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)) 10:17:21 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)) 10:17:21 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)) 10:17:21 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)) 10:17:21 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)) 10:17:21 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)) 10:17:21 INFO - Cleaning up... 10:17:21 INFO - Return code: 0 10:17:21 INFO - Installing jsonschema into virtualenv /builds/slave/test-pgo/build/venv 10:17: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')]} 10:17:21 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:17:21 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:17: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')]} 10:17:21 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:17:21 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:17:21 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 0x7f9318006f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2ac08a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2b8d670>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2c1c8c0>, '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 0x2c1d7c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2c1dc50>, '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': '9c3a94c35cc88655b05d2c08000001b2-1456251229.294312-1288659091', '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 10:17:21 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 10:17:21 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 10:17:21 INFO - Using env: {'DISPLAY': ':0', 10:17:21 INFO - 'HOME': '/home/cltbld', 10:17:21 INFO - 'LANG': 'en_US.UTF-8', 10:17:21 INFO - 'LANGUAGE': 'en_US:en', 10:17:21 INFO - 'LOGNAME': 'cltbld', 10:17:21 INFO - 'MAIL': '/var/mail/cltbld', 10:17:21 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:17:21 INFO - 'MOZ_NO_REMOTE': '1', 10:17:21 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 10:17:21 INFO - 'NO_EM_RESTART': '1', 10:17:21 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 10:17:21 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 10:17:21 INFO - 'PWD': '/builds/slave/test-pgo', 10:17:21 INFO - 'SHELL': '/bin/bash', 10:17:21 INFO - 'SHLVL': '1', 10:17:21 INFO - 'TERM': 'linux', 10:17:21 INFO - 'TMOUT': '86400', 10:17:21 INFO - 'USER': 'cltbld', 10:17:21 INFO - 'XDG_SESSION_COOKIE': '9c3a94c35cc88655b05d2c08000001b2-1456251229.294312-1288659091', 10:17:21 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:17:21 INFO - '_': '/tools/buildbot/bin/python'} 10:17:22 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:17:22 INFO - Downloading/unpacking jsonschema 10:17:22 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 10:17:22 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 10:17:22 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 10:17:22 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 10:17:22 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 10:17:22 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 10:17:23 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 10:17:23 INFO - Downloading/unpacking functools32 (from jsonschema) 10:17:23 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 10:17:23 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 10:17:23 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 10:17:23 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 10:17:23 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 10:17:23 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 10:17:24 INFO - Downloading functools32-3.2.3-2.tar.gz 10:17:24 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/functools32/setup.py) egg_info for package functools32 10:17:24 INFO - warning: no files found matching '*.txt' 10:17:24 INFO - no previously-included directories found matching 'build' 10:17:24 INFO - no previously-included directories found matching 'dist' 10:17:24 INFO - no previously-included directories found matching '.git*' 10:17:24 INFO - Installing collected packages: jsonschema, functools32 10:17:24 INFO - Running setup.py install for functools32 10:17:24 INFO - warning: no files found matching '*.txt' 10:17:24 INFO - no previously-included directories found matching 'build' 10:17:24 INFO - no previously-included directories found matching 'dist' 10:17:24 INFO - no previously-included directories found matching '.git*' 10:17:24 INFO - Successfully installed jsonschema functools32 10:17:24 INFO - Cleaning up... 10:17:24 INFO - Return code: 0 10:17:24 INFO - Installing flake8 into virtualenv /builds/slave/test-pgo/build/venv 10:17:24 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 10:17:24 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:17:24 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:17:24 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 10:17:24 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:17:24 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:17:24 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 0x7f9318006f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2ac08a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2b8d670>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2c1c8c0>, '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 0x2c1d7c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2c1dc50>, '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': '9c3a94c35cc88655b05d2c08000001b2-1456251229.294312-1288659091', '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 10:17:24 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 10:17:24 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 10:17:24 INFO - Using env: {'DISPLAY': ':0', 10:17:24 INFO - 'HOME': '/home/cltbld', 10:17:24 INFO - 'LANG': 'en_US.UTF-8', 10:17:24 INFO - 'LANGUAGE': 'en_US:en', 10:17:24 INFO - 'LOGNAME': 'cltbld', 10:17:24 INFO - 'MAIL': '/var/mail/cltbld', 10:17:24 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:17:24 INFO - 'MOZ_NO_REMOTE': '1', 10:17:24 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 10:17:24 INFO - 'NO_EM_RESTART': '1', 10:17:24 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 10:17:24 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 10:17:24 INFO - 'PWD': '/builds/slave/test-pgo', 10:17:24 INFO - 'SHELL': '/bin/bash', 10:17:24 INFO - 'SHLVL': '1', 10:17:24 INFO - 'TERM': 'linux', 10:17:24 INFO - 'TMOUT': '86400', 10:17:24 INFO - 'USER': 'cltbld', 10:17:24 INFO - 'XDG_SESSION_COOKIE': '9c3a94c35cc88655b05d2c08000001b2-1456251229.294312-1288659091', 10:17:24 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:17:24 INFO - '_': '/tools/buildbot/bin/python'} 10:17:24 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:17:24 INFO - Downloading/unpacking flake8 10:17:24 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 10:17:24 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 10:17:24 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 10:17:24 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 10:17:24 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 10:17:24 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 10:17:26 INFO - Downloading flake8-2.5.0-py2.py3-none-any.whl 10:17:26 INFO - Downloading/unpacking mccabe>=0.2.1,<0.4 (from flake8) 10:17:26 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 10:17:26 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 10:17:26 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 10:17:26 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 10:17:26 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 10:17:26 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 10:17:26 INFO - Downloading mccabe-0.3.1-py2.py3-none-any.whl 10:17:26 INFO - Downloading/unpacking pyflakes>=0.8.1,<1.1 (from flake8) 10:17:26 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 10:17:26 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 10:17:26 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 10:17:26 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 10:17:26 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 10:17:26 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 10:17:26 INFO - Downloading/unpacking pep8>=1.5.7,!=1.6.0,!=1.6.1,!=1.6.2 (from flake8) 10:17:26 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 10:17:26 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 10:17:26 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 10:17:26 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 10:17:26 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 10:17:26 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 10:17:27 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/pep8/setup.py) egg_info for package pep8 10:17:27 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 10:17:27 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 10:17:27 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 10:17:27 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 10:17:27 INFO - no previously-included directories found matching 'docs/_build' 10:17:27 INFO - Installing collected packages: flake8, mccabe, pyflakes, pep8 10:17:27 INFO - Running setup.py install for pep8 10:17:27 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 10:17:27 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 10:17:27 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 10:17:27 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 10:17:27 INFO - no previously-included directories found matching 'docs/_build' 10:17:27 INFO - Installing pep8 script to /builds/slave/test-pgo/build/venv/bin 10:17:27 INFO - Successfully installed flake8 mccabe pyflakes pep8 10:17:27 INFO - Cleaning up... 10:17:27 INFO - Return code: 0 10:17:27 INFO - Running post-action listener: _resource_record_post_action 10:17:27 INFO - Running post-action listener: _start_resource_monitoring 10:17:27 INFO - Starting resource monitoring. 10:17:27 INFO - ##### 10:17:27 INFO - ##### Running install step. 10:17:27 INFO - ##### 10:17:27 INFO - Running pre-action listener: _resource_record_pre_action 10:17:27 INFO - Running main action method: install 10:17:27 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'freeze'] 10:17:27 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip freeze 10:17:27 INFO - Reading from file tmpfile_stdout 10:17:27 INFO - Detecting whether we're running mozinstall >=1.0... 10:17:27 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/mozinstall', '-h'] 10:17:27 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/mozinstall -h 10:17:27 INFO - Reading from file tmpfile_stdout 10:17:27 INFO - Output received: 10:17:27 INFO - Usage: mozinstall [options] installer 10:17:27 INFO - Options: 10:17:27 INFO - -h, --help show this help message and exit 10:17:27 INFO - -d DEST, --destination=DEST 10:17:27 INFO - Directory to install application into. [default: 10:17:27 INFO - "/builds/slave/test-pgo"] 10:17:27 INFO - --app=APP Application being installed. [default: firefox] 10:17:27 INFO - mkdir: /builds/slave/test-pgo/build/application 10:17:27 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'] 10:17:27 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 10:17:43 INFO - Reading from file tmpfile_stdout 10:17:43 INFO - Output received: 10:17:43 INFO - /builds/slave/test-pgo/build/application/firefox/firefox 10:17:43 INFO - Running post-action listener: _resource_record_post_action 10:17:43 INFO - ##### 10:17:43 INFO - ##### Running run-tests step. 10:17:43 INFO - ##### 10:17:43 INFO - Running pre-action listener: _resource_record_pre_action 10:17:43 INFO - Running main action method: run_tests 10:17:43 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/python', '--version'] 10:17:43 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/python --version 10:17:43 INFO - Python 2.7.3 10:17:43 INFO - Return code: 0 10:17:43 INFO - grabbing minidump binary from tooltool 10:17:43 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 10:17:43 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 0x2c1c8c0>, '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 0x2c1d7c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2c1dc50>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test-pgo/build', 'privileged': False}, attempt #1 10:17:43 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 10:17:43 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 10:17:44 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 10:17:44 INFO - Return code: 0 10:17:44 INFO - Chmoding /builds/slave/test-pgo/build/linux64-minidump_stackwalk to 0755 10:17:44 INFO - mkdir: /builds/slave/test-pgo/build/blobber_upload_dir 10:17:44 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test-pgo/build/blobber_upload_dir 10:17:44 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test-pgo/build/linux64-minidump_stackwalk 10:17:44 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test-pgo/build/blobber_upload_dir 10:17:44 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/flake8', '/builds/slave/test-pgo/build/tests/talos/talos'] 10:17:44 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/flake8 /builds/slave/test-pgo/build/tests/talos/talos 10:17:45 INFO - Return code: 0 10:17:45 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/python', '/builds/slave/test-pgo/build/tests/talos/talos/run_tests.py', '--branchName', 'Firefox', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test-pgo/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/F3L9o7a4RkGm4govaunquA/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-013', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs_errorsummary.log', '--log-raw=/builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs_raw.log'] in /builds/slave/test-pgo/build 10:17:45 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/python /builds/slave/test-pgo/build/tests/talos/talos/run_tests.py --branchName Firefox --suite dromaeojs --executablePath /builds/slave/test-pgo/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/F3L9o7a4RkGm4govaunquA/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-013 --webServer localhost --log-tbpl-level=debug --log-errorsummary=/builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs_errorsummary.log --log-raw=/builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs_raw.log 10:17:45 INFO - Using env: {'DISPLAY': ':0', 10:17:45 INFO - 'HOME': '/home/cltbld', 10:17:45 INFO - 'LANG': 'en_US.UTF-8', 10:17:45 INFO - 'LANGUAGE': 'en_US:en', 10:17:45 INFO - 'LOGNAME': 'cltbld', 10:17:45 INFO - 'MAIL': '/var/mail/cltbld', 10:17:45 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test-pgo/build/blobber_upload_dir', 10:17:45 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test-pgo/build/linux64-minidump_stackwalk', 10:17:45 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:17:45 INFO - 'MOZ_NO_REMOTE': '1', 10:17:45 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test-pgo/build/blobber_upload_dir', 10:17:45 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 10:17:45 INFO - 'NO_EM_RESTART': '1', 10:17:45 INFO - 'PATH': '/builds/slave/test-pgo/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 10:17:45 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 10:17:45 INFO - 'PWD': '/builds/slave/test-pgo', 10:17:45 INFO - 'PYTHONPATH': '/builds/slave/test-pgo/build/tests/talos', 10:17:45 INFO - 'SHELL': '/bin/bash', 10:17:45 INFO - 'SHLVL': '1', 10:17:45 INFO - 'TERM': 'linux', 10:17:45 INFO - 'TMOUT': '86400', 10:17:45 INFO - 'USER': 'cltbld', 10:17:45 INFO - 'XDG_SESSION_COOKIE': '9c3a94c35cc88655b05d2c08000001b2-1456251229.294312-1288659091', 10:17:45 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:17:45 INFO - '_': '/tools/buildbot/bin/python'} 10:17:45 INFO - Calling ['/builds/slave/test-pgo/build/venv/bin/python', '/builds/slave/test-pgo/build/tests/talos/talos/run_tests.py', '--branchName', 'Firefox', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test-pgo/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/F3L9o7a4RkGm4govaunquA/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-013', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs_errorsummary.log', '--log-raw=/builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs_raw.log'] with output_timeout 3600 10:17:45 INFO - mozversion application_buildid: 20160223030304 10:17:45 INFO - mozversion application_changeset: 789a12291942763bc1e3a89f97e0b82dc1c9d00b 10:17:45 INFO - mozversion application_display_name: Nightly 10:17:45 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 10:17:45 INFO - mozversion application_name: Firefox 10:17:45 INFO - mozversion application_remotingname: firefox 10:17:45 INFO - mozversion application_repository: https://hg.mozilla.org/mozilla-central 10:17:45 INFO - mozversion application_vendor: Mozilla 10:17:45 INFO - mozversion application_version: 47.0a1 10:17:45 INFO - mozversion platform_buildid: 20160223030304 10:17:45 INFO - mozversion platform_changeset: 789a12291942763bc1e3a89f97e0b82dc1c9d00b 10:17:45 INFO - mozversion platform_repository: https://hg.mozilla.org/mozilla-central 10:17:45 INFO - mozversion platform_version: 47.0a1 10:17:45 INFO - using testdate: 1456251465 10:17:45 INFO - actual date: 1456251465 10:17:45 INFO - starting webserver on 'localhost:41166' 10:17:45 INFO - SUITE-START | Running 2 tests 10:17:45 INFO - TEST-START | dromaeo_css 10:17:45 INFO - operating with platform_type : linux_ 10:17:45 INFO - Initialising browser for dromaeo_css test... 10:17:45 INFO - TEST-INFO | started process 28603 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpKMXUcC/profile http://localhost:41166/getInfo.html) 10:17:49 INFO - PROCESS | 28603 | __metrics Screen width/height:1600/1200 10:17:49 INFO - PROCESS | 28603 | colorDepth:24 10:17:49 INFO - PROCESS | 28603 | Browser inner width/height: 1024/697 10:17:49 INFO - PROCESS | 28603 | __metrics 10:17:50 INFO - PROCESS | 28603 | JavaScript error: resource://app/modules/WebappManager.jsm, line 48: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 10:17:51 INFO - TEST-INFO | 28603: exit 0 10:17:51 INFO - Browser initialized. 10:17:51 INFO - Running cycle 1/1 for dromaeo_css test... 10:17:51 INFO - TEST-INFO | started process 28698 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpKMXUcC/profile -tp file:/builds/slave/test-pgo/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 10:18:03 INFO - PROCESS | 28698 | RSS: Main: 147460096 10:18:03 INFO - PROCESS | 28698 | 10:18:54 INFO - PROCESS | 28698 | 1456251534724 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] 10:21:02 INFO - PROCESS | 28698 | Cycle 1(1): loaded http://localhost:41166/tests/dromaeo/cssquery-dojo.html (next: http://localhost:41166/tests/dromaeo/cssquery-ext.html) 10:21:03 INFO - PROCESS | 28698 | RSS: Main: 214937600 10:21:03 INFO - PROCESS | 28698 | 10:24:06 INFO - PROCESS | 28698 | Cycle 1(1): loaded http://localhost:41166/tests/dromaeo/cssquery-ext.html (next: http://localhost:41166/tests/dromaeo/cssquery-jquery.html) 10:24:06 INFO - PROCESS | 28698 | RSS: Main: 244178944 10:24:06 INFO - PROCESS | 28698 | 10:27:08 INFO - PROCESS | 28698 | Cycle 1(1): loaded http://localhost:41166/tests/dromaeo/cssquery-jquery.html (next: http://localhost:41166/tests/dromaeo/cssquery-mootools.html) 10:27:09 INFO - PROCESS | 28698 | RSS: Main: 241295360 10:27:09 INFO - PROCESS | 28698 | 10:30:11 INFO - PROCESS | 28698 | Cycle 1(1): loaded http://localhost:41166/tests/dromaeo/cssquery-mootools.html (next: http://localhost:41166/tests/dromaeo/cssquery-prototype.html) 10:30:11 INFO - PROCESS | 28698 | RSS: Main: 213073920 10:30:11 INFO - PROCESS | 28698 | 10:33:14 INFO - PROCESS | 28698 | Cycle 1(1): loaded http://localhost:41166/tests/dromaeo/cssquery-prototype.html (next: http://localhost:41166/tests/dromaeo/cssquery-yui.html) 10:33:14 INFO - PROCESS | 28698 | RSS: Main: 192364544 10:33:14 INFO - PROCESS | 28698 | 10:36:17 INFO - PROCESS | 28698 | Cycle 1(1): loaded http://localhost:41166/tests/dromaeo/cssquery-yui.html (next: http://localhost:41166/tests/dromaeo/cssquery-dojo.html) 10:36:17 INFO - PROCESS | 28698 | RSS: Main: 289673216 10:36:17 INFO - PROCESS | 28698 | 10:36:17 INFO - PROCESS | 28698 | __start_tp_report 10:36:17 INFO - PROCESS | 28698 | _x_x_mozilla_page_load 10:36:17 INFO - PROCESS | 28698 | _x_x_mozilla_page_load_details 10:36:17 INFO - PROCESS | 28698 | |i|pagename|runs| 10:36:17 INFO - PROCESS | 28698 | |0;dojo.html;3066.4786986212343;3109.6112985876766;3159.4628913084775;3165.446046941786;3193.4251834669763;4945.62907781916;4988.077205716945;5018.874528136798;5050.84847454577;5075.137226671465;5072.289879416885;5087;5115.079285728568;5124.333836601237;5131.486851314876;4479.440069991251;4551.840685575998;4581.725096494204;4673.1121086993535;4735.0529894021165;4479.574440428154;4566.337881007268;4710.858674239761;4717.481077081536;4718.339432479455;4625.213713668684;4644.907101857978;4656.068786242765;4662.953370466286;4671.906561868761;4678.274867395559;4687.742174180418;4692.202325604655;4705.811767529295;4725;4540.591346778772;4604.976975115103;4627.861164165047;4630.0508395779125;4715.905681886377;4978.850634480935;4982.725950072744;4985.750712464399;4994.275830004629;4994.725290109042;5424.593155513352;5443.755031023614;5447.400785913546;5450.127979523258;5509.586780991442;5516;5517.5585953124055;5521.1442226454965;5532.502074813246;5550.389457159709;5121.667091639031;5140.640155189176;5144.485551444863;5154.845354639367;5192.428832828461;5299.761510732026;5462.044142275086;5500.009998200282;5554.555635549146;5611.943880561143;5310.9734451327495;5354.7858085676135;5359.866003349869;5360.142377219626;5360.624756267024;5370.91943620846;5417.864553386197;5418.268533747893;5426.75579598919;5485.232067510552;5347.51872331492;5352.625316227826;5373.11343628297;5381.246625472437;5430.995265875826;5337.306150200449;5361.973190134025;5378.381486129145;5391.73041347931;5438.374586922476;4151.771652559078;4234.8777573942925;4241.533431322552;4252.022034931983;4303.784810759449;3817.0838998640124;3829.1575853312784;3830.6743926766535;3843.26977874203;3864.265789500042;5058.114829904752;5060.342155519833;5064.7214403207445;5066.797328106908;5108.66793658411;5368.758405871745;5395.352557693023;5406.08096623575;5408.0535906216255;5455.727213639302;5050.722210278396;5073.239014147834;5097.362829646294;5101.0818052750865;5149.356330458692;4604.631629469634;4710.52894710533;4712.929306060412;4724.881877953078;4729.881752956135;5599.188117722907;5623.803166889139;5627.043402621564;5627.071533196977;5653.547716182696;5416.187571864252;5422.8373148805595;5426.104692725656;5429.185622156708;5430.619856609999;5528.834134975958;5566.443355664564;5607.691576963306;5638.407967163389;5641.37944826077;5285;5298.867528311823;5303.655262408085;5304.814331498379;5307.4427185145005;5323.7071961040965;5387.084195686821;5392.299001129828;5395.56835453155;5441.075017246998;5282.841514754564;5301.893962120813;5322.254884316121;5322.467753224647;5378.112611419072;5222.660527065728;5280.6303558750515;5295.364556253275;5303.310569625924;5349.144136938071;5091.6181286402925;5230.607704422107;5234.450382709761;5240.292560504283;5351.491608297206;5205.635605507729;5241.659292145999;5256.500632439912;5304.07178743726;5308.601854860824;5156.355455568054;5178.585713142864;5190.325257716473;5229.9738501308775;5286.15421532553 10:36:17 INFO - PROCESS | 28698 | |1;ext.html;518.3468829275113;520.9062368773622;527.8970600732857;546.5054126015957;551.1319671517361;36470.63529364706;37052.07369815756;37115;37151.628483715154;37155.25689486209;39559.40660890082;40363;40410;40497;40503.79748101255;8330.208630180123;8503.447275927076;8519.616617252239;8520.360972927025;8524.57377131141;8291.95854020732;8396.790080247982;8403.873941890877;8408.495490270572;8409.95795021024;8587.52768597727;8655.523946182957;8660.610272537751;8665.176808203241;8673.522956237435;8570.657173713043;8603.956980215058;8628.439151455135;8628.697995570188;8630.784230394227;8577.442466239674;8662.696805611837;8694.782630434289;8703.390762646617;8704.956475217647;40977.795111024556;41419.585804141876;41424.37863432051;41449.585504144874;41488.58511414877;3311.701946824773;3346.8493917773517;3372.37611041958;3415.282790613974;3492.59835118962;29194.270143246376;29200.41599168026;29419.264518386997;30150.547741783892;30169;3868.497095377611;3875.4380614810693;3966.9008274793073;4001.639852413268;4013.819378127991;254859;263051;263275;264153;264273;43270.134597308504;43691.56308436875;43807.34288985668;43856.78071609685;43877.341839872424;46211;46962.530374695816;46985.5301446988;47002.76498617485;47056.764716176884;13679.931600342134;13685.726285474433;13686.863131368758;13689.452421903212;13716.794248086288;12528.060395470377;12619.116661833767;12645.43095560702;12715.554955576696;12735.363231838557;14673.486427974969;14741.92629036848;14779.37426883042;14819.333130009176;14900;5936.792212272636;6074.544409169242;6095.542834287447;6116.724747386378;6152.415520525632;988.3279370028449;1007.536533194724;1012.4532752313668;1029.2075102171286;1122.8764835868049;26352.60471092935;26413.207603771916;26629.733702663114;26790.196294111207;26827.463450730877;973.7030205787162;1058.5501162006117;1076.1928553584812;1084.6312253833735;1119.9976021460748;13617.591472255848;14350.856491435161;16205.59486012859;16508.504744857673;16889.226631203546;292562;294713;295904;296287;296718;50492.74753626208;51068.489315107116;51311.48688513142;51358;51487.22769158466;1347.4004068189759;1373.1143412498882;1376.2086800089987;1396.5810256922882;1404.39610967283;27134.185974420798;28373.692062811122;28559.42881142407;30452.086437406913;30891.227719307197;42838.57161428346;43861;48897.266541002624;50331;50676;239569;240993;241560;242349;243041;28042.439151216455;28684.282892927844;31353.52969705502;32527.674723252465;32979.8351008253;38176.809115954245;38893.80553097217;40275.3958690614;42390;42487;34200.14499637429;38629.22741545209;39509.604903951746;40229.79885100556;40339.798301008304;34399;34450.655493445745;35002.29995400129;35097.122571935906;35344.469832953044;34799.30401392009;39350.2129957405;40868.591314087666;40950.385744213265;40991.385129222486;30783.384332313675;33585.83207083949;33744;34150.829245854606;34240.828795855865;25777;25839.966401343736;26002.8298726554;26008.34979125461;26235.73764262409 10:36:17 INFO - PROCESS | 28698 | |2;jquery.html;364.513374644849;365.83903082643633;366.5454836003355;367.3772954841543;376.4428645604507;14557.85442145581;15005.92497037516;16347.509574712763;16680;17716;16286.104264265461;16559.586010349747;16796.412125575578;16814.24335904884;16826.915865420688;5181.715005674687;5350.8127215547465;5390.51485366317;5406.107992181305;5425.9728701356435;3979.363301871701;4132.2355364257555;4132.318167502373;5204.479552044803;5697.6011679182475;5913.2608423947;5925.614835035731;5936.7328470218945;5950.9107363389585;5959.046552551593;5703.0589952657765;5879.176915231871;5981.371955944606;5988.461038506512;6009.75960961561;5273.604479664041;5282.286891269668;5288.074586947308;5291.920621190685;5316.946830531684;20279.29022484206;20800.167993280404;20948.581028379347;20965.056572454123;20970.5805883883;2028.6348457277684;2155.461134716321;2210.9889450552805;2242.1143648258844;2347;9306.581203845843;9455.14903658674;9528;9601.855972160423;9757.316987810786;1774.6184570317444;1800.675878341898;1821.1895706410653;1867.075797480256;1947.3963071447897;64635.353646463875;68080;68325.65837170833;69050.65474672645;70085.64957175232;9861.112499875046;10323.48382580868;10635.680929572125;10673.83989240162;10746.94626526878;13844.515441959684;13915.443382264799;13935.442582296797;13955.79066314006;13963.533828947815;7831.412644051719;7963.761087167394;7969.123396426388;8008.719694810654;8018.959905200553;7763.534187948741;7808.414368922354;7854.136045035041;7897.17079706634;7928.563928983961;4532.410786597721;4615.284630882219;4626.884327891762;4635.675502714777;4660.580547750651;1761.5596100974756;1805.6569251842109;1839.871209015356;1884.2839720905968;1899.3447260695038;900.8378491871395;963.2486660404895;981.190517822799;995.3778888194878;1023.242800327767;13979.580612581638;15464.845351546566;16157.515274541782;16843.242054107595;17094.658106837793;873.9606717697592;914.7575892388522;918.5361392496746;922.9123233292827;925.9953700231456;9217.815643687223;9466.29002824791;9475.431474111576;9492.98920956574;9626.422414655142;314545;408463;419051;421707;422617;78169.60915195387;78295;79077;79328.20671793209;80295.59852200818;980.8822941246954;997.481309718942;999.2455695949511;1005.2661557063385;1006.1648831469862;15242.618934526725;15248.3900643973;15405.383784648937;15427.305771240546;15683.921580392025;33479.16302092467;34276.657233427344;34747.13132171615;34760;34925.30149397049;47659;48433.75783121062;48691.269630954856;48920.2661960078;49263;7889.289963903277;7967.844662524018;8008.199180081945;8239.134890836616;8349.37379696513;11568.537258509565;12179.878201217874;12495.750084998432;12596;12781.61655150347;9919.95040024824;10428.061474467335;10505.264631475724;10720.892791072301;10913.618023369145;10624.309419887682;10631.574737010433;10725.410102444128;10925.235233533576;10965.451727413756;8539.231469167804;9228.676996305097;9883.258755593502;10490;10733;8010.3992200584025;8061.39539534549;8091.595420229083;8113.6754529818145;8217.630206640595;10094.293399461967;10628.36229826213;10629.681109566725;10770.461476926279;10832.783344332911 10:36:17 INFO - PROCESS | 28698 | |3;mootools.html;1355.8440779310383;1446.6383404148962;1452.310152677478;1601.767743677167;1764.7088230441987;7633.770986870396;7812.687492500293;7812.882806757889;7816.413768967322;7821.687132514699;7708.96145519273;7867.7246296379635;7883.172266911978;7885.408594355417;7895.368370530358;1953.4823271832975;2239.6304609739373;2280.1107568048474;2296.575133600281;2304.665823455598;2255.954880902381;2259.4690247791755;2269.4553307206315;2272;2274.0789980058103;2307.238611258281;2314.606516892124;2320.14154762738;2320.187934223017;2321.1643808229023;2217.756046834847;2259.6610508423705;2264.2867496738477;2271.1029143488395;2271.3867255840833;2204.7244094488187;2223.444138965259;2230.6430971044715;2235.083615717564;2243.102758896438;6474.805755827333;7534.359579435754;7968.243016913384;8030.799230019238;8035.236652518001;4718.079974404993;4781.0676918001;4825.10735513931;4834;4834.371531700856;3128.436881361354;3201.823899685516;3227.2254658881934;3244.545763593099;3281.606207255121;986.1666891476691;997.110475648649;1006.9798604027951;1041.2711102228395;1089.0906093412011;10677.786444271149;10789.082927951134;10795.244332896622;10811.945940270327;10826.24216304859;3896.298666240104;3953.78254196022;3977;4114;4116.711830171859;8644.524551149747;8816.515091669891;8853.29173666118;8853.690120845868;8870.201681848665;4108.630223279919;4610.2854057621125;4673.392458980311;4675.555822196886;4698.694584851974;4352.368906508538;4357.975875669215;4392.253316936065;4396.978015109968;4403.251447253974;3536.310419468179;3546.6098729139776;3551.236484155919;3583.874564390234;3601.3517566838223;1046.628446901339;1057.8783439904355;1060.7136073260176;1063.7447012717048;1071.6195750508614;1317.4598414649947;1318.7164759576738;1344.395022239996;1353.4045020191083;1362.3937347880099;7443.85112297751;7543.8114047148165;7611.467197296247;7632.923670763222;7633;1113.1039513191797;1129.4352823588206;1130.1185075641013;1130.66645339625;1160.8897154770284;5861.0915308127305;5886.175935369051;5899.823005309848;5937.7921772737745;5938.198343223696;9062.818743625223;9071.092890711008;9201.355905086713;9311.44131352121;9417.340786144903;9364.531773411301;9462.810743785223;9541.18899893503;9601.279904007228;9610.615575377047;7078.539894906815;7212.927870721331;7323.890141647773;7412.814679632945;7414.740484083031;7339.449541284532;7427.034485516848;7452.664630091551;7453.217412171861;7456.96271518639;8474.915250847413;8553.486790792573;8630.913690863263;8756.25571826402;8844.867326990228;8701.825963480822;8762.868556971778;8795.604197810986;8798;8924.375293729376;5703.515201207943;6401.839954001187;6540.313267106885;6611.735530578915;6712.83217919556;7539.924600753922;7548.811279718051;7557.886631700419;7583.165851756413;7602.277783610548;6629.436497897733;6676.365745254193;6770.32296770319;6837.931620683729;7044.6125463100025;6634;6683.298253683293;6714.83212919681;6764.661766911733;6800.93199068003;7021.473389495911;7094.184168820651;7108.395786358217;7118.359347658736;7146.106736657918;6221.440070393686;6233;6249.406306400884;6294.8111556653375;6303.432691057827;6546.869062618816;6561.40947314744;6615.834604134935;6619.503537234823;6623.105880706235 10:36:17 INFO - PROCESS | 28698 | |4;prototype.html;328.47772042452505;329.1393007285948;333.5530389278368;334.60850804558663;340.0003988274472;5749.540036797057;5867.3252575953775;5896.321922978858;5982.82051538454;6005.939940600592;5866.6186697864605;5889.970550147254;5915.438033386832;5946.9107963380475;5959.61262517936;4509.210888094579;4513.887152821173;4513.932291015637;4519.9774001129945;4524;4297.484301883778;4437.179121862449;4523.479799823013;4551.817927282905;4560.3843481130125;4495.056038231975;4495.325701144838;4498.392716983198;4509.954900451003;4517.09658068386;4500.347449619803;4508.684392092555;4511.6165125964335;4512.864614061584;4519.07358991406;3971.4042893565907;3978.0253837809632;3984.322665146903;3984.900377490586;3986.481757371523;5576.609637325389;5584.888302233932;5591.10542313228;5594.944050559483;5623.943760562423;5214.035403450373;5219.895602087975;5221.503957124067;5222.582193424555;5222.92165617516;6003.6097653652805;6181.103739957726;6186.721597528077;6198.81403557894;6252.624842509418;4264.829406823724;4293;4294.828206871722;4299.398084268205;4299.763513006784;6328.6202827830475;6471.805845824632;6579.210494740614;6585.275619681831;6588.604683718992;4365.236083685406;4382.233109205877;4384.583464570861;4390.2317094508335;4398.780060996937;4432.15789000089;4432.180046691373;4433.955660443355;4435.157320109169;4439.223135951195;5155.845324640267;5159.638825282194;5161.225816127611;5170.508801663836;5172.043172013189;6036.5170786336985;6131.14164017038;6316.589421687668;6324.71538780756;6326.43062124411;1540.3607502886177;1561.2974161627312;1565.186103226316;1567.2163918040978;1569.7096037233148;1010.9494525273853;1022.8748376785477;1035.1098055672117;1043.6347278452633;1044.6576149647817;5923.052311630118;5925.288965324189;5926.940730592639;5933.762649494059;5975;6388.073729309224;6407.807765767035;6411.1024456576115;6450.967745161338;6452.612843229327;5934.643921364732;5959.493443057302;5959.7914073008105;5963.582549221513;5969.104634304889;3452.9309413812084;3459.4810778383444;3472.531208286849;3480.582330120402;3483.912902177415;6615.073889655452;6758.087658166183;6760.932390676128;6908.5509441886115;6925.203601585882;6708.127943367331;6732.2931092235585;6738.932610673928;6750.797476075725;6752.797416077526;6878.7248510060035;6888.931110688829;6892.207396149407;6892.517523773287;6895.138107736533;6522.445592124723;6525.706343214471;6533.052707357501;6536.215654121535;6539.411452969255;6277.085488925739;6481.481481481376;6489.610623362613;6495.772647957298;6497.057926600711;6750.628715420699;6756.662166891734;6762.6618669065365;6767.120274364301;6797.796066118024;4328.653707703314;4365.170617582649;4368.776742512102;4371.12577484498;4371.584699453674;6250.687465626791;6407.615543067431;6542.051402546509;6547.050677651619;6557.573757705733;6342.4143964009;6352.555321127476;6353.491720662429;6360.872782544416;6361.236651601837;6285.779997700059;6320.6839658016;6343.714532845941;6349.269833969152;6357.110004599267;6221.906671399842;6230.345813689497;6240.906386404116;6244.344343843831;6247.562670613195;6215.9378406215355;6358.300586935526;6369.426751592379;6369.617822930639;6371.331010244043;6176.258848938156;6204.534659900435;6209.192804935329;6215.595986260879;6218.5647004711045 10:36:17 INFO - PROCESS | 28698 | |5;yui.html;697.9406750426214;762.7101701353488;789.0452552411582;792.2592376128317;800.3632571391505;13054.673633159176;13229.404676789543;13241.337933103354;13252.072354935159;13300.334983250847;12306.138570300083;12306.753864922695;12348.197367171128;12380.938095309511;12383;813.2802469814212;818.1940788323496;825.451075035101;833.2708879730236;835.6949713354643;835.2983493865152;836.2724429746129;837.6272558711375;840.8696652018916;842.7977285451478;880.9603567839463;892.0276898180981;893.4594570284982;893.7050773244846;893.7274131389923;877.7410663854147;880.5289170293862;882.5763633455977;885.6988623867884;887.0730087059006;653.830004198907;654.5450911616429;654.7904670505441;655.0992385469979;655.4657953767664;13394.397252123677;13413.195208287534;13421.194728316332;13437;13437.529686460926;12345.691357716129;12532.81200781989;12964.157329773629;13028.674283142902;13364.933175334158;10747.892521074846;10908.236423450362;10965;11062.668119956334;11475.13936454761;3575.6245594212755;3615.7107431405425;3640.3447379471686;3657.817109144559;3736.4208547675153;44790.55209447929;52929.47070529284;54573.181402279;56285.437145628835;56528.15207771887;10034.749131271778;10298.485075746183;10353.63762268317;10375.27373083892;10473.37159770401;18118.818811811714;18527.81472185261;18554.165062572218;18562.071896405127;18568.535786605175;7928.365730741527;7971.043474783063;7973.641186146638;8010.158933312035;8235.752927412188;4439.267520859022;4500.302453119772;4575.267957126844;4605.746683932416;4624.28323609841;3265.804051756902;3290.3583801158543;3308.983455082709;3311.403947289463;3313.5029745538363;645.9031145328145;661.6790856434625;670.7551743613546;674.0159367323664;683.3747121383977;508.57025813187795;615.8944694273789;636.8248731598848;684.9383555480031;703.9014537964689;8282.461639993382;8625.52559609215;8775.736727898173;9040.095990400907;9093.136152065543;634.55581093234;657.1916542652468;700.4921431961889;707.049019069351;736.7495051682347;3848.461215429842;3849.2301539692176;3862.575116737157;3885.339492286318;3986.123052928351;56176;57394.13908791372;57768;57972.4202757967;58349.4165058344;50373.49626503688;51097.744511277204;51344;52181.478185218424;52352.738236309335;45116.3232551512;46325;51455.48544514507;52088.73955630273;52096.69758256074;7623.847523049619;8370.581470926307;8387.287080598218;8411.53736544496;8542.701005464778;29772.255693607833;34178;34817.07104293732;34892.47661285032;35032.12419689426;37210.81394593118;41209.1758164841;44924.77537612291;45437.31844022409;47560.52439475699;10412.454909422577;10671.626493072705;10991.945040274748;10996.450177491253;11463.369514676773;11842.940785296018;12138.635840924433;12159.878401216229;12367.75264494723;12401.62795116148;11036.724081898017;11409;11484.023857972166;11627.825582616098;11708.70728231801;11151.219414641222;11176.329420234812;11310.377929213972;11487.942560287145;11599.88400115988;10434.68695939123;10466.529006194587;10685.893141068489;10698.73253168677;11016.87358189594;9648.228141748503;9745.26910481731;9908.35595686278;10069.546870390997;10362.222833287684;8803.735887923373;9088.909110909071;9768.616994717282;9830.705078847646;10069.647562335284 10:36:17 INFO - PROCESS | 28698 | __end_tp_report 10:36:17 INFO - PROCESS | 28698 | __start_cc_report 10:36:17 INFO - PROCESS | 28698 | _x_x_mozilla_cycle_collect,748 10:36:17 INFO - PROCESS | 28698 | __end_cc_report 10:36:17 INFO - PROCESS | 28698 | __startTimestamp1456252577939__endTimestamp 10:36:17 INFO - PROCESS | 28698 | 10:36:17 INFO - PROCESS | 28698 | ------- Summary: start ------- 10:36:17 INFO - PROCESS | 28698 | Number of tests: 6 10:36:17 INFO - PROCESS | 28698 | 10:36:17 INFO - PROCESS | 28698 | [#0] dojo.html Cycles:165 Average:5048.70 Median:5230.61 stddev:528.66 (10.1%) stddev-sans-first:506.90 10:36:17 INFO - PROCESS | 28698 | Values: 3066.5 3109.6 3159.5 3165.4 3193.4 4945.6 4988.1 5018.9 5050.8 5075.1 5072.3 5087.0 5115.1 5124.3 5131.5 4479.4 4551.8 4581.7 4673.1 4735.1 4479.6 4566.3 4710.9 4717.5 4718.3 4625.2 4644.9 4656.1 4663.0 4671.9 4678.3 4687.7 4692.2 4705.8 4725.0 4540.6 4605.0 4627.9 4630.1 4715.9 4978.9 4982.7 4985.8 4994.3 4994.7 5424.6 5443.8 5447.4 5450.1 5509.6 5516.0 5517.6 5521.1 5532.5 5550.4 5121.7 5140.6 5144.5 5154.8 5192.4 5299.8 5462.0 5500.0 5554.6 5611.9 5311.0 5354.8 5359.9 5360.1 5360.6 5370.9 5417.9 5418.3 5426.8 5485.2 5347.5 5352.6 5373.1 5381.2 5431.0 5337.3 5362.0 5378.4 5391.7 5438.4 4151.8 4234.9 4241.5 4252.0 4303.8 3817.1 3829.2 3830.7 3843.3 3864.3 5058.1 5060.3 5064.7 5066.8 5108.7 5368.8 5395.4 5406.1 5408.1 5455.7 5050.7 5073.2 5097.4 5101.1 5149.4 4604.6 4710.5 4712.9 4724.9 4729.9 5599.2 5623.8 5627.0 5627.1 5653.5 5416.2 5422.8 5426.1 5429.2 5430.6 5528.8 5566.4 5607.7 5638.4 5641.4 5285.0 5298.9 5303.7 5304.8 5307.4 5323.7 5387.1 5392.3 5395.6 5441.1 5282.8 5301.9 5322.3 5322.5 5378.1 5222.7 5280.6 5295.4 5303.3 5349.1 5091.6 5230.6 5234.5 5240.3 5351.5 5205.6 5241.7 5256.5 5304.1 5308.6 5156.4 5178.6 5190.3 5230.0 5286.2 10:36:17 INFO - PROCESS | 28698 | 10:36:17 INFO - PROCESS | 28698 | [#1] ext.html Cycles:180 Average:43102.83 Median:36761.35 stddev:69557.56 (189.2%) stddev-sans-first:69679.20 10:36:17 INFO - PROCESS | 28698 | Values: 518.3 520.9 527.9 546.5 551.1 36470.6 37052.1 37115.0 37151.6 37155.3 39559.4 40363.0 40410.0 40497.0 40503.8 8330.2 8503.4 8519.6 8520.4 8524.6 8292.0 8396.8 8403.9 8408.5 8410.0 8587.5 8655.5 8660.6 8665.2 8673.5 8570.7 8604.0 8628.4 8628.7 8630.8 8577.4 8662.7 8694.8 8703.4 8705.0 40977.8 41419.6 41424.4 41449.6 41488.6 3311.7 3346.8 3372.4 3415.3 3492.6 29194.3 29200.4 29419.3 30150.5 30169.0 3868.5 3875.4 3966.9 4001.6 4013.8 254859.0 263051.0 263275.0 264153.0 264273.0 43270.1 43691.6 43807.3 43856.8 43877.3 46211.0 46962.5 46985.5 47002.8 47056.8 13679.9 13685.7 13686.9 13689.5 13716.8 12528.1 12619.1 12645.4 12715.6 12735.4 14673.5 14741.9 14779.4 14819.3 14900.0 5936.8 6074.5 6095.5 6116.7 6152.4 988.3 1007.5 1012.5 1029.2 1122.9 26352.6 26413.2 26629.7 26790.2 26827.5 973.7 1058.6 1076.2 1084.6 1120.0 13617.6 14350.9 16205.6 16508.5 16889.2 292562.0 294713.0 295904.0 296287.0 296718.0 50492.7 51068.5 51311.5 51358.0 51487.2 1347.4 1373.1 1376.2 1396.6 1404.4 27134.2 28373.7 28559.4 30452.1 30891.2 42838.6 43861.0 48897.3 50331.0 50676.0 239569.0 240993.0 241560.0 242349.0 243041.0 28042.4 28684.3 31353.5 32527.7 32979.8 38176.8 38893.8 40275.4 42390.0 42487.0 34200.1 38629.2 39509.6 40229.8 40339.8 34399.0 34450.7 35002.3 35097.1 35344.5 34799.3 39350.2 40868.6 40950.4 40991.4 30783.4 33585.8 33744.0 34150.8 34240.8 25777.0 25840.0 26002.8 26008.3 26235.7 10:36:17 INFO - PROCESS | 28698 | 10:36:17 INFO - PROCESS | 28698 | [#2] jquery.html Cycles:180 Average:24510.43 Median:213574.71 stddev:65871.13 (30.8%) stddev-sans-first:66030.96 10:36:17 INFO - PROCESS | 28698 | Values: 364.5 365.8 366.5 367.4 376.4 14557.9 15005.9 16347.5 16680.0 17716.0 16286.1 16559.6 16796.4 16814.2 16826.9 5181.7 5350.8 5390.5 5406.1 5426.0 3979.4 4132.2 4132.3 5204.5 5697.6 5913.3 5925.6 5936.7 5950.9 5959.0 5703.1 5879.2 5981.4 5988.5 6009.8 5273.6 5282.3 5288.1 5291.9 5316.9 20279.3 20800.2 20948.6 20965.1 20970.6 2028.6 2155.5 2211.0 2242.1 2347.0 9306.6 9455.1 9528.0 9601.9 9757.3 1774.6 1800.7 1821.2 1867.1 1947.4 64635.4 68080.0 68325.7 69050.7 70085.6 9861.1 10323.5 10635.7 10673.8 10746.9 13844.5 13915.4 13935.4 13955.8 13963.5 7831.4 7963.8 7969.1 8008.7 8019.0 7763.5 7808.4 7854.1 7897.2 7928.6 4532.4 4615.3 4626.9 4635.7 4660.6 1761.6 1805.7 1839.9 1884.3 1899.3 900.8 963.2 981.2 995.4 1023.2 13979.6 15464.8 16157.5 16843.2 17094.7 874.0 914.8 918.5 922.9 926.0 9217.8 9466.3 9475.4 9493.0 9626.4 314545.0 408463.0 419051.0 421707.0 422617.0 78169.6 78295.0 79077.0 79328.2 80295.6 980.9 997.5 999.2 1005.3 1006.2 15242.6 15248.4 15405.4 15427.3 15683.9 33479.2 34276.7 34747.1 34760.0 34925.3 47659.0 48433.8 48691.3 48920.3 49263.0 7889.3 7967.8 8008.2 8239.1 8349.4 11568.5 12179.9 12495.8 12596.0 12781.6 9920.0 10428.1 10505.3 10720.9 10913.6 10624.3 10631.6 10725.4 10925.2 10965.5 8539.2 9228.7 9883.3 10490.0 10733.0 8010.4 8061.4 8091.6 8113.7 8217.6 10094.3 10628.4 10629.7 10770.5 10832.8 10:36:17 INFO - PROCESS | 28698 | 10:36:17 INFO - PROCESS | 28698 | [#3] mootools.html Cycles:180 Average:5458.44 Median:6241.20 stddev:2834.50 (45.4%) stddev-sans-first:2825.68 10:36:17 INFO - PROCESS | 28698 | Values: 1355.8 1446.6 1452.3 1601.8 1764.7 7633.8 7812.7 7812.9 7816.4 7821.7 7709.0 7867.7 7883.2 7885.4 7895.4 1953.5 2239.6 2280.1 2296.6 2304.7 2256.0 2259.5 2269.5 2272.0 2274.1 2307.2 2314.6 2320.1 2320.2 2321.2 2217.8 2259.7 2264.3 2271.1 2271.4 2204.7 2223.4 2230.6 2235.1 2243.1 6474.8 7534.4 7968.2 8030.8 8035.2 4718.1 4781.1 4825.1 4834.0 4834.4 3128.4 3201.8 3227.2 3244.5 3281.6 986.2 997.1 1007.0 1041.3 1089.1 10677.8 10789.1 10795.2 10811.9 10826.2 3896.3 3953.8 3977.0 4114.0 4116.7 8644.5 8816.5 8853.3 8853.7 8870.2 4108.6 4610.3 4673.4 4675.6 4698.7 4352.4 4358.0 4392.3 4397.0 4403.3 3536.3 3546.6 3551.2 3583.9 3601.4 1046.6 1057.9 1060.7 1063.7 1071.6 1317.5 1318.7 1344.4 1353.4 1362.4 7443.9 7543.8 7611.5 7632.9 7633.0 1113.1 1129.4 1130.1 1130.7 1160.9 5861.1 5886.2 5899.8 5937.8 5938.2 9062.8 9071.1 9201.4 9311.4 9417.3 9364.5 9462.8 9541.2 9601.3 9610.6 7078.5 7212.9 7323.9 7412.8 7414.7 7339.4 7427.0 7452.7 7453.2 7457.0 8474.9 8553.5 8630.9 8756.3 8844.9 8701.8 8762.9 8795.6 8798.0 8924.4 5703.5 6401.8 6540.3 6611.7 6712.8 7539.9 7548.8 7557.9 7583.2 7602.3 6629.4 6676.4 6770.3 6837.9 7044.6 6634.0 6683.3 6714.8 6764.7 6800.9 7021.5 7094.2 7108.4 7118.4 7146.1 6221.4 6233.0 6249.4 6294.8 6303.4 6546.9 6561.4 6615.8 6619.5 6623.1 10:36:17 INFO - PROCESS | 28698 | 10:36:17 INFO - PROCESS | 28698 | [#4] prototype.html Cycles:180 Average:5248.75 Median:5940.78 stddev:1604.17 (27.0%) stddev-sans-first:1565.58 10:36:17 INFO - PROCESS | 28698 | Values: 328.5 329.1 333.6 334.6 340.0 5749.5 5867.3 5896.3 5982.8 6005.9 5866.6 5890.0 5915.4 5946.9 5959.6 4509.2 4513.9 4513.9 4520.0 4524.0 4297.5 4437.2 4523.5 4551.8 4560.4 4495.1 4495.3 4498.4 4510.0 4517.1 4500.3 4508.7 4511.6 4512.9 4519.1 3971.4 3978.0 3984.3 3984.9 3986.5 5576.6 5584.9 5591.1 5594.9 5623.9 5214.0 5219.9 5221.5 5222.6 5222.9 6003.6 6181.1 6186.7 6198.8 6252.6 4264.8 4293.0 4294.8 4299.4 4299.8 6328.6 6471.8 6579.2 6585.3 6588.6 4365.2 4382.2 4384.6 4390.2 4398.8 4432.2 4432.2 4434.0 4435.2 4439.2 5155.8 5159.6 5161.2 5170.5 5172.0 6036.5 6131.1 6316.6 6324.7 6326.4 1540.4 1561.3 1565.2 1567.2 1569.7 1010.9 1022.9 1035.1 1043.6 1044.7 5923.1 5925.3 5926.9 5933.8 5975.0 6388.1 6407.8 6411.1 6451.0 6452.6 5934.6 5959.5 5959.8 5963.6 5969.1 3452.9 3459.5 3472.5 3480.6 3483.9 6615.1 6758.1 6760.9 6908.6 6925.2 6708.1 6732.3 6738.9 6750.8 6752.8 6878.7 6888.9 6892.2 6892.5 6895.1 6522.4 6525.7 6533.1 6536.2 6539.4 6277.1 6481.5 6489.6 6495.8 6497.1 6750.6 6756.7 6762.7 6767.1 6797.8 4328.7 4365.2 4368.8 4371.1 4371.6 6250.7 6407.6 6542.1 6547.1 6557.6 6342.4 6352.6 6353.5 6360.9 6361.2 6285.8 6320.7 6343.7 6349.3 6357.1 6221.9 6230.3 6240.9 6244.3 6247.6 6215.9 6358.3 6369.4 6369.6 6371.3 6176.3 6204.5 6209.2 6215.6 6218.6 10:36:17 INFO - PROCESS | 28698 | 10:36:17 INFO - PROCESS | 28698 | [#5] yui.html Cycles:180 Average:13982.37 Median:25006.29 stddev:16356.93 (65.4%) stddev-sans-first:16372.39 10:36:17 INFO - PROCESS | 28698 | Values: 697.9 762.7 789.0 792.3 800.4 13054.7 13229.4 13241.3 13252.1 13300.3 12306.1 12306.8 12348.2 12380.9 12383.0 813.3 818.2 825.5 833.3 835.7 835.3 836.3 837.6 840.9 842.8 881.0 892.0 893.5 893.7 893.7 877.7 880.5 882.6 885.7 887.1 653.8 654.5 654.8 655.1 655.5 13394.4 13413.2 13421.2 13437.0 13437.5 12345.7 12532.8 12964.2 13028.7 13364.9 10747.9 10908.2 10965.0 11062.7 11475.1 3575.6 3615.7 3640.3 3657.8 3736.4 44790.6 52929.5 54573.2 56285.4 56528.2 10034.7 10298.5 10353.6 10375.3 10473.4 18118.8 18527.8 18554.2 18562.1 18568.5 7928.4 7971.0 7973.6 8010.2 8235.8 4439.3 4500.3 4575.3 4605.7 4624.3 3265.8 3290.4 3309.0 3311.4 3313.5 645.9 661.7 670.8 674.0 683.4 508.6 615.9 636.8 684.9 703.9 8282.5 8625.5 8775.7 9040.1 9093.1 634.6 657.2 700.5 707.0 736.7 3848.5 3849.2 3862.6 3885.3 3986.1 56176.0 57394.1 57768.0 57972.4 58349.4 50373.5 51097.7 51344.0 52181.5 52352.7 45116.3 46325.0 51455.5 52088.7 52096.7 7623.8 8370.6 8387.3 8411.5 8542.7 29772.3 34178.0 34817.1 34892.5 35032.1 37210.8 41209.2 44924.8 45437.3 47560.5 10412.5 10671.6 10991.9 10996.5 11463.4 11842.9 12138.6 12159.9 12367.8 12401.6 11036.7 11409.0 11484.0 11627.8 11708.7 11151.2 11176.3 11310.4 11487.9 11599.9 10434.7 10466.5 10685.9 10698.7 11016.9 9648.2 9745.3 9908.4 10069.5 10362.2 8803.7 9088.9 9768.6 9830.7 10069.6 10:36:17 INFO - PROCESS | 28698 | -------- Summary: end -------- 10:36:17 INFO - PROCESS | 28698 | 10:36:18 INFO - TEST-INFO | 28698: exit 0 10:36:18 INFO - TEST-OK | dromaeo_css | took 1113326ms 10:36:18 INFO - TEST-START | kraken 10:36:18 INFO - operating with platform_type : linux_ 10:36:18 INFO - Initialising browser for kraken test... 10:36:18 INFO - TEST-INFO | started process 28892 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpUTyPb8/profile http://localhost:41166/getInfo.html) 10:36:23 INFO - PROCESS | 28892 | __metrics Screen width/height:1600/1200 10:36:23 INFO - PROCESS | 28892 | colorDepth:24 10:36:23 INFO - PROCESS | 28892 | Browser inner width/height: 1024/697 10:36:23 INFO - PROCESS | 28892 | __metrics 10:36:23 INFO - PROCESS | 28892 | JavaScript error: resource://app/modules/WebappManager.jsm, line 48: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 10:36:24 INFO - TEST-INFO | 28892: exit 0 10:36:24 INFO - Browser initialized. 10:36:24 INFO - Running cycle 1/1 for kraken test... 10:36:24 INFO - TEST-INFO | started process 28978 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpUTyPb8/profile -tp file:/builds/slave/test-pgo/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 10:36:36 INFO - PROCESS | 28978 | RSS: Main: 147595264 10:36:36 INFO - PROCESS | 28978 | 10:36:39 INFO - PROCESS | 28978 | Cycle 1(1): loaded http://localhost:41166/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:41166/tests/kraken/driver.html?testName=audio-beat-detection) 10:36:39 INFO - PROCESS | 28978 | RSS: Main: 192221184 10:36:39 INFO - PROCESS | 28978 | 10:36:42 INFO - PROCESS | 28978 | Cycle 1(1): loaded http://localhost:41166/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:41166/tests/kraken/driver.html?testName=audio-dft) 10:36:42 INFO - PROCESS | 28978 | RSS: Main: 183160832 10:36:42 INFO - PROCESS | 28978 | 10:36:45 INFO - PROCESS | 28978 | Cycle 1(1): loaded http://localhost:41166/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:41166/tests/kraken/driver.html?testName=audio-fft) 10:36:46 INFO - PROCESS | 28978 | RSS: Main: 164782080 10:36:46 INFO - PROCESS | 28978 | 10:36:48 INFO - PROCESS | 28978 | Cycle 1(1): loaded http://localhost:41166/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:41166/tests/kraken/driver.html?testName=audio-oscillator) 10:36:48 INFO - PROCESS | 28978 | RSS: Main: 167137280 10:36:48 INFO - PROCESS | 28978 | 10:36:51 INFO - PROCESS | 28978 | Cycle 1(1): loaded http://localhost:41166/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:41166/tests/kraken/driver.html?testName=imaging-gaussian-blur) 10:36:51 INFO - PROCESS | 28978 | RSS: Main: 170749952 10:36:51 INFO - PROCESS | 28978 | 10:36:54 INFO - PROCESS | 28978 | Cycle 1(1): loaded http://localhost:41166/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:41166/tests/kraken/driver.html?testName=imaging-darkroom) 10:36:55 INFO - PROCESS | 28978 | RSS: Main: 168972288 10:36:55 INFO - PROCESS | 28978 | 10:36:58 INFO - PROCESS | 28978 | Cycle 1(1): loaded http://localhost:41166/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:41166/tests/kraken/driver.html?testName=imaging-desaturate) 10:36:59 INFO - PROCESS | 28978 | RSS: Main: 170827776 10:36:59 INFO - PROCESS | 28978 | 10:37:02 INFO - PROCESS | 28978 | Cycle 1(1): loaded http://localhost:41166/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:41166/tests/kraken/driver.html?testName=json-parse-financial) 10:37:02 INFO - PROCESS | 28978 | RSS: Main: 169316352 10:37:02 INFO - PROCESS | 28978 | 10:37:04 INFO - PROCESS | 28978 | Cycle 1(1): loaded http://localhost:41166/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:41166/tests/kraken/driver.html?testName=json-stringify-tinderbox) 10:37:04 INFO - PROCESS | 28978 | RSS: Main: 179585024 10:37:04 INFO - PROCESS | 28978 | 10:37:06 INFO - PROCESS | 28978 | Cycle 1(1): loaded http://localhost:41166/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:41166/tests/kraken/driver.html?testName=stanford-crypto-aes) 10:37:07 INFO - PROCESS | 28978 | RSS: Main: 176087040 10:37:07 INFO - PROCESS | 28978 | 10:37:09 INFO - PROCESS | 28978 | Cycle 1(1): loaded http://localhost:41166/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:41166/tests/kraken/driver.html?testName=stanford-crypto-ccm) 10:37:09 INFO - PROCESS | 28978 | RSS: Main: 195051520 10:37:09 INFO - PROCESS | 28978 | 10:37:12 INFO - PROCESS | 28978 | Cycle 1(1): loaded http://localhost:41166/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:41166/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 10:37:12 INFO - PROCESS | 28978 | RSS: Main: 198049792 10:37:12 INFO - PROCESS | 28978 | 10:37:15 INFO - PROCESS | 28978 | Cycle 1(1): loaded http://localhost:41166/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:41166/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 10:37:15 INFO - PROCESS | 28978 | RSS: Main: 198086656 10:37:15 INFO - PROCESS | 28978 | 10:37:17 INFO - PROCESS | 28978 | Cycle 1(1): loaded http://localhost:41166/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:41166/tests/kraken/driver.html?testName=ai-astar) 10:37:17 INFO - PROCESS | 28978 | RSS: Main: 258564096 10:37:17 INFO - PROCESS | 28978 | 10:37:17 INFO - PROCESS | 28978 | __start_tp_report 10:37:17 INFO - PROCESS | 28978 | _x_x_mozilla_page_load 10:37:17 INFO - PROCESS | 28978 | _x_x_mozilla_page_load_details 10:37:17 INFO - PROCESS | 28978 | |i|pagename|runs| 10:37:17 INFO - PROCESS | 28978 | |0;ai-astar;110;112;106;111;111;112;100;110;111;111 10:37:17 INFO - PROCESS | 28978 | |1;audio-beat-detection;146;122;155;164;124;160;151;125;166;127 10:37:17 INFO - PROCESS | 28978 | |2;audio-dft;160;161;160;159;160;161;161;163;163;160 10:37:17 INFO - PROCESS | 28978 | |3;audio-fft;73;72;100;96;73;75;74;124;95;74 10:37:17 INFO - PROCESS | 28978 | |4;audio-oscillator;96;96;140;98;96;95;137;96;95;137 10:37:17 INFO - PROCESS | 28978 | |5;imaging-gaussian-blur;120;114;115;115;114;115;114;115;115;115 10:37:17 INFO - PROCESS | 28978 | |6;imaging-darkroom;146;145;145;145;146;145;147;145;146;146 10:37:17 INFO - PROCESS | 28978 | |7;imaging-desaturate;96;96;97;97;97;96;97;96;95;95 10:37:17 INFO - PROCESS | 28978 | |8;json-parse-financial;56;55;57;55;55;62;55;64;55;56 10:37:17 INFO - PROCESS | 28978 | |9;json-stringify-tinderbox;66;67;68;68;67;68;67;67;68;68 10:37:17 INFO - PROCESS | 28978 | |10;stanford-crypto-aes;82;83;82;82;84;83;90;82;84;82 10:37:17 INFO - PROCESS | 28978 | |11;stanford-crypto-ccm;119;130;121;130;121;117;125;130;115;116 10:37:17 INFO - PROCESS | 28978 | |12;stanford-crypto-pbkdf2;152;140;151;163;150;138;151;143;151;154 10:37:17 INFO - PROCESS | 28978 | |13;stanford-crypto-sha256-iterative;72;71;68;71;69;68;69;69;68;68 10:37:17 INFO - PROCESS | 28978 | __end_tp_report 10:37:17 INFO - PROCESS | 28978 | __start_cc_report 10:37:17 INFO - PROCESS | 28978 | _x_x_mozilla_cycle_collect,952 10:37:17 INFO - PROCESS | 28978 | __end_cc_report 10:37:17 INFO - PROCESS | 28978 | __startTimestamp1456252637942__endTimestamp 10:37:17 INFO - PROCESS | 28978 | 10:37:17 INFO - PROCESS | 28978 | ------- Summary: start ------- 10:37:17 INFO - PROCESS | 28978 | Number of tests: 14 10:37:17 INFO - PROCESS | 28978 | 10:37:17 INFO - PROCESS | 28978 | [#0] ai-astar Cycles:10 Average:109.40 Median:111.00 stddev:3.72 (3.3%) stddev-sans-first:3.94 10:37:17 INFO - PROCESS | 28978 | Values: 110.0 112.0 106.0 111.0 111.0 112.0 100.0 110.0 111.0 111.0 10:37:17 INFO - PROCESS | 28978 | 10:37:17 INFO - PROCESS | 28978 | [#1] audio-beat-detection Cycles:10 Average:144.00 Median:153.00 stddev:17.79 (11.6%) stddev-sans-first:18.85 10:37:17 INFO - PROCESS | 28978 | Values: 146.0 122.0 155.0 164.0 124.0 160.0 151.0 125.0 166.0 127.0 10:37:17 INFO - PROCESS | 28978 | 10:37:17 INFO - PROCESS | 28978 | [#2] audio-dft Cycles:10 Average:160.80 Median:161.00 stddev:1.32 (0.8%) stddev-sans-first:1.36 10:37:17 INFO - PROCESS | 28978 | Values: 160.0 161.0 160.0 159.0 160.0 161.0 161.0 163.0 163.0 160.0 10:37:17 INFO - PROCESS | 28978 | 10:37:17 INFO - PROCESS | 28978 | [#3] audio-fft Cycles:10 Average:85.60 Median:74.00 stddev:17.52 (23.7%) stddev-sans-first:17.98 10:37:17 INFO - PROCESS | 28978 | Values: 73.0 72.0 100.0 96.0 73.0 75.0 74.0 124.0 95.0 74.0 10:37:17 INFO - PROCESS | 28978 | 10:37:17 INFO - PROCESS | 28978 | [#4] audio-oscillator Cycles:10 Average:108.60 Median:96.00 stddev:20.32 (21.2%) stddev-sans-first:21.04 10:37:17 INFO - PROCESS | 28978 | Values: 96.0 96.0 140.0 98.0 96.0 95.0 137.0 96.0 95.0 137.0 10:37:17 INFO - PROCESS | 28978 | 10:37:17 INFO - PROCESS | 28978 | [#5] imaging-gaussian-blur Cycles:10 Average:115.20 Median:115.00 stddev:1.75 (1.5%) stddev-sans-first:0.50 10:37:17 INFO - PROCESS | 28978 | Values: 120.0 114.0 115.0 115.0 114.0 115.0 114.0 115.0 115.0 115.0 10:37:17 INFO - PROCESS | 28978 | 10:37:17 INFO - PROCESS | 28978 | [#6] imaging-darkroom Cycles:10 Average:145.60 Median:146.00 stddev:0.70 (0.5%) stddev-sans-first:0.73 10:37:17 INFO - PROCESS | 28978 | Values: 146.0 145.0 145.0 145.0 146.0 145.0 147.0 145.0 146.0 146.0 10:37:17 INFO - PROCESS | 28978 | 10:37:17 INFO - PROCESS | 28978 | [#7] imaging-desaturate Cycles:10 Average:96.20 Median:96.50 stddev:0.79 (0.8%) stddev-sans-first:0.83 10:37:17 INFO - PROCESS | 28978 | Values: 96.0 96.0 97.0 97.0 97.0 96.0 97.0 96.0 95.0 95.0 10:37:17 INFO - PROCESS | 28978 | 10:37:17 INFO - PROCESS | 28978 | [#8] json-parse-financial Cycles:10 Average:57.00 Median:56.00 stddev:3.27 (5.8%) stddev-sans-first:3.44 10:37:17 INFO - PROCESS | 28978 | Values: 56.0 55.0 57.0 55.0 55.0 62.0 55.0 64.0 55.0 56.0 10:37:17 INFO - PROCESS | 28978 | 10:37:17 INFO - PROCESS | 28978 | [#9] json-stringify-tinderbox Cycles:10 Average:67.40 Median:68.00 stddev:0.70 (1.0%) stddev-sans-first:0.53 10:37:17 INFO - PROCESS | 28978 | Values: 66.0 67.0 68.0 68.0 67.0 68.0 67.0 67.0 68.0 68.0 10:37:17 INFO - PROCESS | 28978 | 10:37:17 INFO - PROCESS | 28978 | [#10] stanford-crypto-aes Cycles:10 Average:83.40 Median:83.00 stddev:2.46 (3.0%) stddev-sans-first:2.55 10:37:17 INFO - PROCESS | 28978 | Values: 82.0 83.0 82.0 82.0 84.0 83.0 90.0 82.0 84.0 82.0 10:37:17 INFO - PROCESS | 28978 | 10:37:17 INFO - PROCESS | 28978 | [#11] stanford-crypto-ccm Cycles:10 Average:122.40 Median:123.00 stddev:5.97 (4.9%) stddev-sans-first:6.20 10:37:17 INFO - PROCESS | 28978 | Values: 119.0 130.0 121.0 130.0 121.0 117.0 125.0 130.0 115.0 116.0 10:37:17 INFO - PROCESS | 28978 | 10:37:17 INFO - PROCESS | 28978 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:149.30 Median:151.00 stddev:7.30 (4.8%) stddev-sans-first:7.68 10:37:17 INFO - PROCESS | 28978 | Values: 152.0 140.0 151.0 163.0 150.0 138.0 151.0 143.0 151.0 154.0 10:37:17 INFO - PROCESS | 28978 | 10:37:17 INFO - PROCESS | 28978 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:69.30 Median:69.00 stddev:1.49 (2.2%) stddev-sans-first:1.22 10:37:17 INFO - PROCESS | 28978 | Values: 72.0 71.0 68.0 71.0 69.0 68.0 69.0 69.0 68.0 68.0 10:37:17 INFO - PROCESS | 28978 | -------- Summary: end -------- 10:37:17 INFO - PROCESS | 28978 | 10:37:18 INFO - TEST-INFO | 28978: exit 0 10:37:18 INFO - TEST-OK | kraken | took 60261ms 10:37:18 INFO - SUITE-END | took 1173s 10:37:19 INFO - Completed test suite (00:19:33) 10:37:19 INFO - Working with test: dromaeo_css 10:37:19 INFO - Generating results file: dromaeo_css 10:37:19 INFO - Working with test: kraken 10:37:19 INFO - Generating results file: kraken 10:37:19 INFO - javascript benchmark 10:37:19 INFO - Posting result 0 of 2 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 10:37:19 INFO - process_Request line: dromaeo_css graph.html#tests=[[72,1,35]] 10:37:19 INFO - process_Request line: dromaeo_css 6832.58 graph.html#tests=[[72,1,35]] 10:37:19 INFO - Posting result 1 of 2 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 10:37:19 INFO - process_Request line: kraken 1514.20 graph.html#tests=[[232,1,35]] 10:37:19 INFO - RETURN: dromaeo_css: 6832.58 10:37:19 INFO - RETURN: kraken: 1514.20 10:37:19 INFO - javascript benchmark 10:37:19 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"lowerIsBetter": false, "subtests": [{"lowerIsBetter": false, "replicates": [3066.4786986212343, 3109.6112985876766, 3159.4628913084775, 3165.446046941786, 3193.4251834669763, 4945.62907781916, 4988.077205716945, 5018.874528136798, 5050.84847454577, 5075.137226671465, 5072.289879416885, 5087.0, 5115.079285728568, 5124.333836601237, 5131.486851314876, 4479.440069991251, 4551.840685575998, 4581.725096494204, 4673.1121086993535, 4735.0529894021165, 4479.574440428154, 4566.337881007268, 4710.858674239761, 4717.481077081536, 4718.339432479455, 4625.213713668684, 4644.907101857978, 4656.068786242765, 4662.953370466286, 4671.906561868761, 4678.274867395559, 4687.742174180418, 4692.202325604655, 4705.811767529295, 4725.0, 4540.591346778772, 4604.976975115103, 4627.861164165047, 4630.0508395779125, 4715.905681886377, 4978.850634480935, 4982.725950072744, 4985.750712464399, 4994.275830004629, 4994.725290109042, 5424.593155513352, 5443.755031023614, 5447.400785913546, 5450.127979523258, 5509.586780991442, 5516.0, 5517.5585953124055, 5521.1442226454965, 5532.502074813246, 5550.389457159709, 5121.667091639031, 5140.640155189176, 5144.485551444863, 5154.845354639367, 5192.428832828461, 5299.761510732026, 5462.044142275086, 5500.009998200282, 5554.555635549146, 5611.943880561143, 5310.9734451327495, 5354.7858085676135, 5359.866003349869, 5360.142377219626, 5360.624756267024, 5370.91943620846, 5417.864553386197, 5418.268533747893, 5426.75579598919, 5485.232067510552, 5347.51872331492, 5352.625316227826, 5373.11343628297, 5381.246625472437, 5430.995265875826, 5337.306150200449, 5361.973190134025, 5378.381486129145, 5391.73041347931, 5438.374586922476, 4151.771652559078, 4234.8777573942925, 4241.533431322552, 4252.022034931983, 4303.784810759449, 3817.0838998640124, 3829.1575853312784, 3830.6743926766535, 3843.26977874203, 3864.265789500042, 5058.114829904752, 5060.342155519833, 5064.7214403207445, 5066.797328106908, 5108.66793658411, 5368.758405871745, 5395.352557693023, 5406.08096623575, 5408.0535906216255, 5455.727213639302, 5050.722210278396, 5073.239014147834, 5097.362829646294, 5101.0818052750865, 5149.356330458692, 4604.631629469634, 4710.52894710533, 4712.929306060412, 4724.881877953078, 4729.881752956135, 5599.188117722907, 5623.803166889139, 5627.043402621564, 5627.071533196977, 5653.547716182696, 5416.187571864252, 5422.8373148805595, 5426.104692725656, 5429.185622156708, 5430.619856609999, 5528.834134975958, 5566.443355664564, 5607.691576963306, 5638.407967163389, 5641.37944826077, 5285.0, 5298.867528311823, 5303.655262408085, 5304.814331498379, 5307.4427185145005, 5323.7071961040965, 5387.084195686821, 5392.299001129828, 5395.56835453155, 5441.075017246998, 5282.841514754564, 5301.893962120813, 5322.254884316121, 5322.467753224647, 5378.112611419072, 5222.660527065728, 5280.6303558750515, 5295.364556253275, 5303.310569625924, 5349.144136938071, 5091.6181286402925, 5230.607704422107, 5234.450382709761, 5240.292560504283, 5351.491608297206, 5205.635605507729, 5241.659292145999, 5256.500632439912, 5304.07178743726, 5308.601854860824, 5156.355455568054, 5178.585713142864, 5190.325257716473, 5229.9738501308775, 5286.15421532553], "unit": "score", "name": "dojo.html", "value": 5016.7043904183465}, {"lowerIsBetter": false, "replicates": [518.3468829275113, 520.9062368773622, 527.8970600732857, 546.5054126015957, 551.1319671517361, 36470.63529364706, 37052.07369815756, 37115.0, 37151.628483715154, 37155.25689486209, 39559.40660890082, 40363.0, 40410.0, 40497.0, 40503.79748101255, 8330.208630180123, 8503.447275927076, 8519.616617252239, 8520.360972927025, 8524.57377131141, 8291.95854020732, 8396.790080247982, 8403.873941890877, 8408.495490270572, 8409.95795021024, 8587.52768597727, 8655.523946182957, 8660.610272537751, 8665.176808203241, 8673.522956237435, 8570.657173713043, 8603.956980215058, 8628.439151455135, 8628.697995570188, 8630.784230394227, 8577.442466239674, 8662.696805611837, 8694.782630434289, 8703.390762646617, 8704.956475217647, 40977.795111024556, 41419.585804141876, 41424.37863432051, 41449.585504144874, 41488.58511414877, 3311.701946824773, 3346.8493917773517, 3372.37611041958, 3415.282790613974, 3492.59835118962, 29194.270143246376, 29200.41599168026, 29419.264518386997, 30150.547741783892, 30169.0, 3868.497095377611, 3875.4380614810693, 3966.9008274793073, 4001.639852413268, 4013.819378127991, 254859.0, 263051.0, 263275.0, 264153.0, 264273.0, 43270.134597308504, 43691.56308436875, 43807.34288985668, 43856.78071609685, 43877.341839872424, 46211.0, 46962.530374695816, 46985.5301446988, 47002.76498617485, 47056.764716176884, 13679.931600342134, 13685.726285474433, 13686.863131368758, 13689.452421903212, 13716.794248086288, 12528.060395470377, 12619.116661833767, 12645.43095560702, 12715.554955576696, 12735.363231838557, 14673.486427974969, 14741.92629036848, 14779.37426883042, 14819.333130009176, 14900.0, 5936.792212272636, 6074.544409169242, 6095.542834287447, 6116.724747386378, 6152.415520525632, 988.3279370028449, 1007.536533194724, 1012.4532752313668, 1029.2075102171286, 1122.8764835868049, 26352.60471092935, 26413.207603771916, 26629.733702663114, 26790.196294111207, 26827.463450730877, 973.7030205787162, 1058.5501162006117, 1076.1928553584812, 1084.6312253833735, 1119.9976021460748, 13617.591472255848, 14350.856491435161, 16205.59486012859, 16508.504744857673, 16889.226631203546, 292562.0, 294713.0, 295904.0, 296287.0, 296718.0, 50492.74753626208, 51068.489315107116, 51311.48688513142, 51358.0, 51487.22769158466, 1347.4004068189759, 1373.1143412498882, 1376.2086800089987, 1396.5810256922882, 1404.39610967283, 27134.185974420798, 28373.692062811122, 28559.42881142407, 30452.086437406913, 30891.227719307197, 42838.57161428346, 43861.0, 48897.266541002624, 50331.0, 50676.0, 239569.0, 240993.0, 241560.0, 242349.0, 243041.0, 28042.439151216455, 28684.282892927844, 31353.52969705502, 32527.674723252465, 32979.8351008253, 38176.809115954245, 38893.80553097217, 40275.3958690614, 42390.0, 42487.0, 34200.14499637429, 38629.22741545209, 39509.604903951746, 40229.79885100556, 40339.798301008304, 34399.0, 34450.655493445745, 35002.29995400129, 35097.122571935906, 35344.469832953044, 34799.30401392009, 39350.2129957405, 40868.591314087666, 40950.385744213265, 40991.385129222486, 30783.384332313675, 33585.83207083949, 33744.0, 34150.829245854606, 34240.828795855865, 25777.0, 25839.966401343736, 26002.8298726554, 26008.34979125461, 26235.73764262409], "unit": "score", "name": "ext.html", "value": 17726.13826793991}, {"lowerIsBetter": false, "replicates": [364.513374644849, 365.83903082643633, 366.5454836003355, 367.3772954841543, 376.4428645604507, 14557.85442145581, 15005.92497037516, 16347.509574712763, 16680.0, 17716.0, 16286.104264265461, 16559.586010349747, 16796.412125575578, 16814.24335904884, 16826.915865420688, 5181.715005674687, 5350.8127215547465, 5390.51485366317, 5406.107992181305, 5425.9728701356435, 3979.363301871701, 4132.2355364257555, 4132.318167502373, 5204.479552044803, 5697.6011679182475, 5913.2608423947, 5925.614835035731, 5936.7328470218945, 5950.9107363389585, 5959.046552551593, 5703.0589952657765, 5879.176915231871, 5981.371955944606, 5988.461038506512, 6009.75960961561, 5273.604479664041, 5282.286891269668, 5288.074586947308, 5291.920621190685, 5316.946830531684, 20279.29022484206, 20800.167993280404, 20948.581028379347, 20965.056572454123, 20970.5805883883, 2028.6348457277684, 2155.461134716321, 2210.9889450552805, 2242.1143648258844, 2347.0, 9306.581203845843, 9455.14903658674, 9528.0, 9601.855972160423, 9757.316987810786, 1774.6184570317444, 1800.675878341898, 1821.1895706410653, 1867.075797480256, 1947.3963071447897, 64635.353646463875, 68080.0, 68325.65837170833, 69050.65474672645, 70085.64957175232, 9861.112499875046, 10323.48382580868, 10635.680929572125, 10673.83989240162, 10746.94626526878, 13844.515441959684, 13915.443382264799, 13935.442582296797, 13955.79066314006, 13963.533828947815, 7831.412644051719, 7963.761087167394, 7969.123396426388, 8008.719694810654, 8018.959905200553, 7763.534187948741, 7808.414368922354, 7854.136045035041, 7897.17079706634, 7928.563928983961, 4532.410786597721, 4615.284630882219, 4626.884327891762, 4635.675502714777, 4660.580547750651, 1761.5596100974756, 1805.6569251842109, 1839.871209015356, 1884.2839720905968, 1899.3447260695038, 900.8378491871395, 963.2486660404895, 981.190517822799, 995.3778888194878, 1023.242800327767, 13979.580612581638, 15464.845351546566, 16157.515274541782, 16843.242054107595, 17094.658106837793, 873.9606717697592, 914.7575892388522, 918.5361392496746, 922.9123233292827, 925.9953700231456, 9217.815643687223, 9466.29002824791, 9475.431474111576, 9492.98920956574, 9626.422414655142, 314545.0, 408463.0, 419051.0, 421707.0, 422617.0, 78169.60915195387, 78295.0, 79077.0, 79328.20671793209, 80295.59852200818, 980.8822941246954, 997.481309718942, 999.2455695949511, 1005.2661557063385, 1006.1648831469862, 15242.618934526725, 15248.3900643973, 15405.383784648937, 15427.305771240546, 15683.921580392025, 33479.16302092467, 34276.657233427344, 34747.13132171615, 34760.0, 34925.30149397049, 47659.0, 48433.75783121062, 48691.269630954856, 48920.2661960078, 49263.0, 7889.289963903277, 7967.844662524018, 8008.199180081945, 8239.134890836616, 8349.37379696513, 11568.537258509565, 12179.878201217874, 12495.750084998432, 12596.0, 12781.61655150347, 9919.95040024824, 10428.061474467335, 10505.264631475724, 10720.892791072301, 10913.618023369145, 10624.309419887682, 10631.574737010433, 10725.410102444128, 10925.235233533576, 10965.451727413756, 8539.231469167804, 9228.676996305097, 9883.258755593502, 10490.0, 10733.0, 8010.3992200584025, 8061.39539534549, 8091.595420229083, 8113.6754529818145, 8217.630206640595, 10094.293399461967, 10628.36229826213, 10629.681109566725, 10770.461476926279, 10832.783344332911], "unit": "score", "name": "jquery.html", "value": 8408.77682714491}, {"lowerIsBetter": false, "replicates": [1355.8440779310383, 1446.6383404148962, 1452.310152677478, 1601.767743677167, 1764.7088230441987, 7633.770986870396, 7812.687492500293, 7812.882806757889, 7816.413768967322, 7821.687132514699, 7708.96145519273, 7867.7246296379635, 7883.172266911978, 7885.408594355417, 7895.368370530358, 1953.4823271832975, 2239.6304609739373, 2280.1107568048474, 2296.575133600281, 2304.665823455598, 2255.954880902381, 2259.4690247791755, 2269.4553307206315, 2272.0, 2274.0789980058103, 2307.238611258281, 2314.606516892124, 2320.14154762738, 2320.187934223017, 2321.1643808229023, 2217.756046834847, 2259.6610508423705, 2264.2867496738477, 2271.1029143488395, 2271.3867255840833, 2204.7244094488187, 2223.444138965259, 2230.6430971044715, 2235.083615717564, 2243.102758896438, 6474.805755827333, 7534.359579435754, 7968.243016913384, 8030.799230019238, 8035.236652518001, 4718.079974404993, 4781.0676918001, 4825.10735513931, 4834.0, 4834.371531700856, 3128.436881361354, 3201.823899685516, 3227.2254658881934, 3244.545763593099, 3281.606207255121, 986.1666891476691, 997.110475648649, 1006.9798604027951, 1041.2711102228395, 1089.0906093412011, 10677.786444271149, 10789.082927951134, 10795.244332896622, 10811.945940270327, 10826.24216304859, 3896.298666240104, 3953.78254196022, 3977.0, 4114.0, 4116.711830171859, 8644.524551149747, 8816.515091669891, 8853.29173666118, 8853.690120845868, 8870.201681848665, 4108.630223279919, 4610.2854057621125, 4673.392458980311, 4675.555822196886, 4698.694584851974, 4352.368906508538, 4357.975875669215, 4392.253316936065, 4396.978015109968, 4403.251447253974, 3536.310419468179, 3546.6098729139776, 3551.236484155919, 3583.874564390234, 3601.3517566838223, 1046.628446901339, 1057.8783439904355, 1060.7136073260176, 1063.7447012717048, 1071.6195750508614, 1317.4598414649947, 1318.7164759576738, 1344.395022239996, 1353.4045020191083, 1362.3937347880099, 7443.85112297751, 7543.8114047148165, 7611.467197296247, 7632.923670763222, 7633.0, 1113.1039513191797, 1129.4352823588206, 1130.1185075641013, 1130.66645339625, 1160.8897154770284, 5861.0915308127305, 5886.175935369051, 5899.823005309848, 5937.7921772737745, 5938.198343223696, 9062.818743625223, 9071.092890711008, 9201.355905086713, 9311.44131352121, 9417.340786144903, 9364.531773411301, 9462.810743785223, 9541.18899893503, 9601.279904007228, 9610.615575377047, 7078.539894906815, 7212.927870721331, 7323.890141647773, 7412.814679632945, 7414.740484083031, 7339.449541284532, 7427.034485516848, 7452.664630091551, 7453.217412171861, 7456.96271518639, 8474.915250847413, 8553.486790792573, 8630.913690863263, 8756.25571826402, 8844.867326990228, 8701.825963480822, 8762.868556971778, 8795.604197810986, 8798.0, 8924.375293729376, 5703.515201207943, 6401.839954001187, 6540.313267106885, 6611.735530578915, 6712.83217919556, 7539.924600753922, 7548.811279718051, 7557.886631700419, 7583.165851756413, 7602.277783610548, 6629.436497897733, 6676.365745254193, 6770.32296770319, 6837.931620683729, 7044.6125463100025, 6634.0, 6683.298253683293, 6714.83212919681, 6764.661766911733, 6800.93199068003, 7021.473389495911, 7094.184168820651, 7108.395786358217, 7118.359347658736, 7146.106736657918, 6221.440070393686, 6233.0, 6249.406306400884, 6294.8111556653375, 6303.432691057827, 6546.869062618816, 6561.40947314744, 6615.834604134935, 6619.503537234823, 6623.105880706235], "unit": "score", "name": "mootools.html", "value": 4488.254401037498}, {"lowerIsBetter": false, "replicates": [328.47772042452505, 329.1393007285948, 333.5530389278368, 334.60850804558663, 340.0003988274472, 5749.540036797057, 5867.3252575953775, 5896.321922978858, 5982.82051538454, 6005.939940600592, 5866.6186697864605, 5889.970550147254, 5915.438033386832, 5946.9107963380475, 5959.61262517936, 4509.210888094579, 4513.887152821173, 4513.932291015637, 4519.9774001129945, 4524.0, 4297.484301883778, 4437.179121862449, 4523.479799823013, 4551.817927282905, 4560.3843481130125, 4495.056038231975, 4495.325701144838, 4498.392716983198, 4509.954900451003, 4517.09658068386, 4500.347449619803, 4508.684392092555, 4511.6165125964335, 4512.864614061584, 4519.07358991406, 3971.4042893565907, 3978.0253837809632, 3984.322665146903, 3984.900377490586, 3986.481757371523, 5576.609637325389, 5584.888302233932, 5591.10542313228, 5594.944050559483, 5623.943760562423, 5214.035403450373, 5219.895602087975, 5221.503957124067, 5222.582193424555, 5222.92165617516, 6003.6097653652805, 6181.103739957726, 6186.721597528077, 6198.81403557894, 6252.624842509418, 4264.829406823724, 4293.0, 4294.828206871722, 4299.398084268205, 4299.763513006784, 6328.6202827830475, 6471.805845824632, 6579.210494740614, 6585.275619681831, 6588.604683718992, 4365.236083685406, 4382.233109205877, 4384.583464570861, 4390.2317094508335, 4398.780060996937, 4432.15789000089, 4432.180046691373, 4433.955660443355, 4435.157320109169, 4439.223135951195, 5155.845324640267, 5159.638825282194, 5161.225816127611, 5170.508801663836, 5172.043172013189, 6036.5170786336985, 6131.14164017038, 6316.589421687668, 6324.71538780756, 6326.43062124411, 1540.3607502886177, 1561.2974161627312, 1565.186103226316, 1567.2163918040978, 1569.7096037233148, 1010.9494525273853, 1022.8748376785477, 1035.1098055672117, 1043.6347278452633, 1044.6576149647817, 5923.052311630118, 5925.288965324189, 5926.940730592639, 5933.762649494059, 5975.0, 6388.073729309224, 6407.807765767035, 6411.1024456576115, 6450.967745161338, 6452.612843229327, 5934.643921364732, 5959.493443057302, 5959.7914073008105, 5963.582549221513, 5969.104634304889, 3452.9309413812084, 3459.4810778383444, 3472.531208286849, 3480.582330120402, 3483.912902177415, 6615.073889655452, 6758.087658166183, 6760.932390676128, 6908.5509441886115, 6925.203601585882, 6708.127943367331, 6732.2931092235585, 6738.932610673928, 6750.797476075725, 6752.797416077526, 6878.7248510060035, 6888.931110688829, 6892.207396149407, 6892.517523773287, 6895.138107736533, 6522.445592124723, 6525.706343214471, 6533.052707357501, 6536.215654121535, 6539.411452969255, 6277.085488925739, 6481.481481481376, 6489.610623362613, 6495.772647957298, 6497.057926600711, 6750.628715420699, 6756.662166891734, 6762.6618669065365, 6767.120274364301, 6797.796066118024, 4328.653707703314, 4365.170617582649, 4368.776742512102, 4371.12577484498, 4371.584699453674, 6250.687465626791, 6407.615543067431, 6542.051402546509, 6547.050677651619, 6557.573757705733, 6342.4143964009, 6352.555321127476, 6353.491720662429, 6360.872782544416, 6361.236651601837, 6285.779997700059, 6320.6839658016, 6343.714532845941, 6349.269833969152, 6357.110004599267, 6221.906671399842, 6230.345813689497, 6240.906386404116, 6244.344343843831, 6247.562670613195, 6215.9378406215355, 6358.300586935526, 6369.426751592379, 6369.617822930639, 6371.331010244043, 6176.258848938156, 6204.534659900435, 6209.192804935329, 6215.595986260879, 6218.5647004711045], "unit": "score", "name": "prototype.html", "value": 4725.009315991059}, {"lowerIsBetter": false, "replicates": [697.9406750426214, 762.7101701353488, 789.0452552411582, 792.2592376128317, 800.3632571391505, 13054.673633159176, 13229.404676789543, 13241.337933103354, 13252.072354935159, 13300.334983250847, 12306.138570300083, 12306.753864922695, 12348.197367171128, 12380.938095309511, 12383.0, 813.2802469814212, 818.1940788323496, 825.451075035101, 833.2708879730236, 835.6949713354643, 835.2983493865152, 836.2724429746129, 837.6272558711375, 840.8696652018916, 842.7977285451478, 880.9603567839463, 892.0276898180981, 893.4594570284982, 893.7050773244846, 893.7274131389923, 877.7410663854147, 880.5289170293862, 882.5763633455977, 885.6988623867884, 887.0730087059006, 653.830004198907, 654.5450911616429, 654.7904670505441, 655.0992385469979, 655.4657953767664, 13394.397252123677, 13413.195208287534, 13421.194728316332, 13437.0, 13437.529686460926, 12345.691357716129, 12532.81200781989, 12964.157329773629, 13028.674283142902, 13364.933175334158, 10747.892521074846, 10908.236423450362, 10965.0, 11062.668119956334, 11475.13936454761, 3575.6245594212755, 3615.7107431405425, 3640.3447379471686, 3657.817109144559, 3736.4208547675153, 44790.55209447929, 52929.47070529284, 54573.181402279, 56285.437145628835, 56528.15207771887, 10034.749131271778, 10298.485075746183, 10353.63762268317, 10375.27373083892, 10473.37159770401, 18118.818811811714, 18527.81472185261, 18554.165062572218, 18562.071896405127, 18568.535786605175, 7928.365730741527, 7971.043474783063, 7973.641186146638, 8010.158933312035, 8235.752927412188, 4439.267520859022, 4500.302453119772, 4575.267957126844, 4605.746683932416, 4624.28323609841, 3265.804051756902, 3290.3583801158543, 3308.983455082709, 3311.403947289463, 3313.5029745538363, 645.9031145328145, 661.6790856434625, 670.7551743613546, 674.0159367323664, 683.3747121383977, 508.57025813187795, 615.8944694273789, 636.8248731598848, 684.9383555480031, 703.9014537964689, 8282.461639993382, 8625.52559609215, 8775.736727898173, 9040.095990400907, 9093.136152065543, 634.55581093234, 657.1916542652468, 700.4921431961889, 707.049019069351, 736.7495051682347, 3848.461215429842, 3849.2301539692176, 3862.575116737157, 3885.339492286318, 3986.123052928351, 56176.0, 57394.13908791372, 57768.0, 57972.4202757967, 58349.4165058344, 50373.49626503688, 51097.744511277204, 51344.0, 52181.478185218424, 52352.738236309335, 45116.3232551512, 46325.0, 51455.48544514507, 52088.73955630273, 52096.69758256074, 7623.847523049619, 8370.581470926307, 8387.287080598218, 8411.53736544496, 8542.701005464778, 29772.255693607833, 34178.0, 34817.07104293732, 34892.47661285032, 35032.12419689426, 37210.81394593118, 41209.1758164841, 44924.77537612291, 45437.31844022409, 47560.52439475699, 10412.454909422577, 10671.626493072705, 10991.945040274748, 10996.450177491253, 11463.369514676773, 11842.940785296018, 12138.635840924433, 12159.878401216229, 12367.75264494723, 12401.62795116148, 11036.724081898017, 11409.0, 11484.023857972166, 11627.825582616098, 11708.70728231801, 11151.219414641222, 11176.329420234812, 11310.377929213972, 11487.942560287145, 11599.88400115988, 10434.68695939123, 10466.529006194587, 10685.893141068489, 10698.73253168677, 11016.87358189594, 9648.228141748503, 9745.26910481731, 9908.35595686278, 10069.546870390997, 10362.222833287684, 8803.735887923373, 9088.909110909071, 9768.616994717282, 9830.705078847646, 10069.647562335284], "unit": "score", "name": "yui.html", "value": 6415.452683615617}], "name": "dromaeo_css", "value": 6832.5859357720765}, {"lowerIsBetter": true, "subtests": [{"lowerIsBetter": true, "replicates": [110.0, 112.0, 106.0, 111.0, 111.0, 112.0, 100.0, 110.0, 111.0, 111.0], "unit": "score", "name": "ai-astar", "value": 109.4}, {"lowerIsBetter": true, "replicates": [146.0, 122.0, 155.0, 164.0, 124.0, 160.0, 151.0, 125.0, 166.0, 127.0], "unit": "score", "name": "audio-beat-detection", "value": 144.0}, {"lowerIsBetter": true, "replicates": [160.0, 161.0, 160.0, 159.0, 160.0, 161.0, 161.0, 163.0, 163.0, 160.0], "unit": "score", "name": "audio-dft", "value": 160.8}, {"lowerIsBetter": true, "replicates": [73.0, 72.0, 100.0, 96.0, 73.0, 75.0, 74.0, 124.0, 95.0, 74.0], "unit": "score", "name": "audio-fft", "value": 85.6}, {"lowerIsBetter": true, "replicates": [96.0, 96.0, 140.0, 98.0, 96.0, 95.0, 137.0, 96.0, 95.0, 137.0], "unit": "score", "name": "audio-oscillator", "value": 108.6}, {"lowerIsBetter": true, "replicates": [120.0, 114.0, 115.0, 115.0, 114.0, 115.0, 114.0, 115.0, 115.0, 115.0], "unit": "score", "name": "imaging-gaussian-blur", "value": 115.2}, {"lowerIsBetter": true, "replicates": [146.0, 145.0, 145.0, 145.0, 146.0, 145.0, 147.0, 145.0, 146.0, 146.0], "unit": "score", "name": "imaging-darkroom", "value": 145.6}, {"lowerIsBetter": true, "replicates": [96.0, 96.0, 97.0, 97.0, 97.0, 96.0, 97.0, 96.0, 95.0, 95.0], "unit": "score", "name": "imaging-desaturate", "value": 96.2}, {"lowerIsBetter": true, "replicates": [56.0, 55.0, 57.0, 55.0, 55.0, 62.0, 55.0, 64.0, 55.0, 56.0], "unit": "score", "name": "json-parse-financial", "value": 57.0}, {"lowerIsBetter": true, "replicates": [66.0, 67.0, 68.0, 68.0, 67.0, 68.0, 67.0, 67.0, 68.0, 68.0], "unit": "score", "name": "json-stringify-tinderbox", "value": 67.4}, {"lowerIsBetter": true, "replicates": [82.0, 83.0, 82.0, 82.0, 84.0, 83.0, 90.0, 82.0, 84.0, 82.0], "unit": "score", "name": "stanford-crypto-aes", "value": 83.4}, {"lowerIsBetter": true, "replicates": [119.0, 130.0, 121.0, 130.0, 121.0, 117.0, 125.0, 130.0, 115.0, 116.0], "unit": "score", "name": "stanford-crypto-ccm", "value": 122.4}, {"lowerIsBetter": true, "replicates": [152.0, 140.0, 151.0, 163.0, 150.0, 138.0, 151.0, 143.0, 151.0, 154.0], "unit": "score", "name": "stanford-crypto-pbkdf2", "value": 149.3}, {"lowerIsBetter": true, "replicates": [72.0, 71.0, 68.0, 71.0, 69.0, 68.0, 69.0, 69.0, 68.0, 68.0], "unit": "score", "name": "stanford-crypto-sha256-iterative", "value": 69.3}], "name": "kraken", "value": 1514.2000000000003}]} 10:37:19 INFO - TinderboxPrint: TalosResult: {"graphserver": {"kraken": {"url": "http://graphs.mozilla.org/graph.html#tests=[[232,1,35]]", "result": "1514.20"}, "dromaeo_css": {"url": "http://graphs.mozilla.org/graph.html#tests=[[72,1,35]]", "result": "6832.58"}}} 10:37:19 INFO - Return code: 0 10:37:19 INFO - Validating PERFHERDER_DATA against /builds/slave/test-pgo/build/tests/talos/treeherder-schemas/performance-artifact.json 10:37:19 INFO - # TBPL SUCCESS # 10:37:19 INFO - Running post-action listener: _resource_record_post_action 10:37:19 INFO - Running post-run listener: _resource_record_post_run 10:37:20 INFO - Total resource usage - Wall time: 1191s; CPU: 13.0%; Read bytes: 0; Write bytes: 537120768; Read time: 0; Write time: 389860 10:37:20 INFO - install - Wall time: 17s; CPU: 14.0%; Read bytes: 0; Write bytes: 240631808; Read time: 0; Write time: 230688 10:37:20 INFO - run-tests - Wall time: 1175s; CPU: 13.0%; Read bytes: 0; Write bytes: 296488960; Read time: 0; Write time: 159172 10:37:20 INFO - Running post-run listener: _upload_blobber_files 10:37:20 INFO - Blob upload gear active. 10:37:20 INFO - Preparing to upload files from /builds/slave/test-pgo/build/blobber_upload_dir. 10:37:20 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 10:37:20 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', 'Firefox', '-d', '/builds/slave/test-pgo/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test-pgo/build/uploaded_files.json'] 10:37:20 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 Firefox -d /builds/slave/test-pgo/build/blobber_upload_dir --output-manifest /builds/slave/test-pgo/build/uploaded_files.json 10:37:20 INFO - (blobuploader) - INFO - Open directory for files ... 10:37:20 INFO - (blobuploader) - INFO - Uploading /builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs_raw.log ... 10:37:20 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 10:37:20 INFO - (blobuploader) - INFO - Uploading, attempt #1. 10:37:21 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_raw.log: uploaded 10:37:21 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 10:37:21 INFO - (blobuploader) - INFO - Done attempting. 10:37:21 INFO - (blobuploader) - INFO - Uploading /builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs_errorsummary.log ... 10:37:21 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 10:37:21 INFO - (blobuploader) - INFO - Uploading, attempt #1. 10:37:22 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_errorsummary.log: uploaded 10:37:22 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 10:37:22 INFO - (blobuploader) - INFO - Done attempting. 10:37:22 INFO - (blobuploader) - INFO - Iteration through files over. 10:37:22 INFO - Return code: 0 10:37:22 INFO - rmtree: /builds/slave/test-pgo/build/uploaded_files.json 10:37:22 INFO - retry: Calling remove with args: ('/builds/slave/test-pgo/build/uploaded_files.json',), kwargs: {}, attempt #1 10:37:22 INFO - Setting buildbot property blobber_files to {"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/a6e38c3c8ac1e4565005093ad7d27cfa3bcfd27ae934905e59e41082d31508ef8aa63507225b14a9fe122389f62acb1acc943e8504f432e6261bc006693e8c04", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/7a3807e3407c8406d15f83787e53d67969a9108591a7b1d16304981c4b32cbd4c34385c133b33130bfbc15fddda2b8d4868148676c9c7d68b16b9d329b7879cb"} 10:37:22 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test-pgo/properties/blobber_files 10:37:22 INFO - Writing to file /builds/slave/test-pgo/properties/blobber_files 10:37:22 INFO - Contents: 10:37:22 INFO - blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/a6e38c3c8ac1e4565005093ad7d27cfa3bcfd27ae934905e59e41082d31508ef8aa63507225b14a9fe122389f62acb1acc943e8504f432e6261bc006693e8c04", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/7a3807e3407c8406d15f83787e53d67969a9108591a7b1d16304981c4b32cbd4c34385c133b33130bfbc15fddda2b8d4868148676c9c7d68b16b9d329b7879cb"} 10:37:22 INFO - Running post-run listener: copy_logs_to_upload_dir 10:37:22 INFO - Copying logs to upload dir... 10:37:22 INFO - mkdir: /builds/slave/test-pgo/build/upload/logs 10:37:22 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1240.097136 ========= master_lag: 5.65 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 45 secs) (at 2016-02-23 10:37:28.303731) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-02-23 10:37:28.307085) ========= 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=9c3a94c35cc88655b05d2c08000001b2-1456251229.294312-1288659091 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/a6e38c3c8ac1e4565005093ad7d27cfa3bcfd27ae934905e59e41082d31508ef8aa63507225b14a9fe122389f62acb1acc943e8504f432e6261bc006693e8c04", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/7a3807e3407c8406d15f83787e53d67969a9108591a7b1d16304981c4b32cbd4c34385c133b33130bfbc15fddda2b8d4868148676c9c7d68b16b9d329b7879cb"} build_url:https://queue.taskcluster.net/v1/task/F3L9o7a4RkGm4govaunquA/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.011186 build_url: 'https://queue.taskcluster.net/v1/task/F3L9o7a4RkGm4govaunquA/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2' blobber_files: '{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/a6e38c3c8ac1e4565005093ad7d27cfa3bcfd27ae934905e59e41082d31508ef8aa63507225b14a9fe122389f62acb1acc943e8504f432e6261bc006693e8c04", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/7a3807e3407c8406d15f83787e53d67969a9108591a7b1d16304981c4b32cbd4c34385c133b33130bfbc15fddda2b8d4868148676c9c7d68b16b9d329b7879cb"}' ========= master_lag: 0.16 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-02-23 10:37:28.478364) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 1 secs) (at 2016-02-23 10:37:28.478739) ========= 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=9c3a94c35cc88655b05d2c08000001b2-1456251229.294312-1288659091 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004591 ========= master_lag: 1.41 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 1 secs) (at 2016-02-23 10:37:29.889286) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-02-23 10:37:29.889637) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-02-23 10:37:29.894819) ========= ========= Total master_lag: 7.43 =========