builder: mozilla-aurora_ubuntu64_hw_test-dromaeojs-e10s-pgo slave: talos-linux64-ix-021 starttime: 1457430460.06 results: success (0) buildid: 20160307110832 builduid: b0fbdd96eb50429c953c1789946b3361 revision: a06ac8e3220a ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-03-08 01:47:40.059416) ========= master: http://buildbot-master104.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-03-08 01:47:40.059861) ========= ========= Started set props: basedir (results: 0, elapsed: 0 secs) (at 2016-03-08 01:47:40.060166) ========= 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=df17445c3590ff7897617a0e00000225-1457430363.597437-543552692 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False /builds/slave/test-pgo program finished with exit code 0 elapsedTime=0.006393 basedir: '/builds/slave/test-pgo' ========= master_lag: 0.25 ========= ========= Finished set props: basedir (results: 0, elapsed: 0 secs) (at 2016-03-08 01:47:40.311676) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-03-08 01:47:40.311962) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-03-08 01:47:40.332895) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-03-08 01:47:40.333252) ========= 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=df17445c3590ff7897617a0e00000225-1457430363.597437-543552692 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.023452 ========= master_lag: 0.02 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-03-08 01:47:40.380403) ========= ========= Started set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2016-03-08 01:47:40.380700) ========= script_repo_url: https://hg.mozilla.org/build/mozharness ========= Finished set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2016-03-08 01:47:40.381057) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-03-08 01:47:40.381364) ========= 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=df17445c3590ff7897617a0e00000225-1457430363.597437-543552692 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2016-03-08 01:47:40-- 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% 17.5M=0.001s 2016-03-08 01:47:40 (17.5 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.234493 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-03-08 01:47:40.628219) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-03-08 01:47:40.628533) ========= 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=df17445c3590ff7897617a0e00000225-1457430363.597437-543552692 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.046466 ========= master_lag: 0.01 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-03-08 01:47:40.685566) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2016-03-08 01:47:40.685888) ========= bash -c 'python archiver_client.py mozharness --repo releases/mozilla-aurora --rev a06ac8e3220a --destination scripts --debug' in dir /builds/slave/test-pgo/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', u'python archiver_client.py mozharness --repo releases/mozilla-aurora --rev a06ac8e3220a --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=df17445c3590ff7897617a0e00000225-1457430363.597437-543552692 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2016-03-08 01:47:40,859 Setting DEBUG logging. 2016-03-08 01:47:40,859 attempt 1/10 2016-03-08 01:47:40,859 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/releases/mozilla-aurora/a06ac8e3220a?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-03-08 01:47:41,748 unpacking tar archive at: mozilla-aurora-a06ac8e3220a/testing/mozharness/ program finished with exit code 0 elapsedTime=1.176017 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2016-03-08 01:47:41.874360) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-03-08 01:47:41.875183) ========= echo a06ac8e3220a in dir /builds/slave/test-pgo/. (timeout 1200 secs) watching logfiles {} argv: ['echo', u'a06ac8e3220a'] 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=df17445c3590ff7897617a0e00000225-1457430363.597437-543552692 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False a06ac8e3220a program finished with exit code 0 elapsedTime=0.004621 script_repo_revision: 'a06ac8e3220a' ========= master_lag: 0.05 ========= ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-03-08 01:47:41.926894) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-03-08 01:47:41.927205) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-03-08 01:47:41.938003) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 4 secs) (at 2016-03-08 01:47:41.938515) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Mozilla-Aurora --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Mozilla-Aurora in dir /builds/slave/test-pgo/. (timeout 3600 secs) (maxTime 7200 secs) watching logfiles {} argv: ['/tools/buildbot/bin/python', 'scripts/scripts/talos_script.py', '--suite', 'dromaeojs-e10s', '--add-option', '--webServer,localhost', '--branch-name', 'Mozilla-Aurora', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Mozilla-Aurora'] 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=df17445c3590ff7897617a0e00000225-1457430363.597437-543552692 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 01:47:42 INFO - MultiFileLogger online at 20160308 01:47:42 in /builds/slave/test-pgo 01:47:42 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Mozilla-Aurora --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Mozilla-Aurora 01:47:42 INFO - Dumping config to /builds/slave/test-pgo/logs/localconfig.json. 01:47:42 INFO - {'append_to_log': False, 01:47:42 INFO - 'base_work_dir': '/builds/slave/test-pgo', 01:47:42 INFO - 'blob_upload_branch': 'Mozilla-Aurora', 01:47:42 INFO - 'blob_uploader_auth_file': '/builds/slave/test-pgo/oauth.txt', 01:47:42 INFO - 'branch': 'Mozilla-Aurora', 01:47:42 INFO - 'buildbot_json_path': 'buildprops.json', 01:47:42 INFO - 'config_files': ('talos/linux_config.py',), 01:47:42 INFO - 'default_actions': ('clobber', 01:47:42 INFO - 'read-buildbot-config', 01:47:42 INFO - 'download-and-extract', 01:47:42 INFO - 'populate-webroot', 01:47:42 INFO - 'create-virtualenv', 01:47:42 INFO - 'install', 01:47:42 INFO - 'run-tests'), 01:47:42 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 01:47:42 INFO - 'download_minidump_stackwalk': True, 01:47:42 INFO - 'download_symbols': 'ondemand', 01:47:42 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 01:47:42 INFO - 'tooltool.py': '/tools/tooltool.py', 01:47:42 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 01:47:42 INFO - '/tools/misc-python/virtualenv.py')}, 01:47:42 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 01:47:42 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 01:47:42 INFO - 'installer_path': 'installer.exe', 01:47:42 INFO - 'log_level': 'info', 01:47:42 INFO - 'log_name': 'talos', 01:47:42 INFO - 'log_to_console': True, 01:47:42 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 01:47:42 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 01:47:42 INFO - 'opt_config_files': (), 01:47:42 INFO - 'pip_index': False, 01:47:42 INFO - 'sps_profile': False, 01:47:42 INFO - 'sps_profile_interval': 0, 01:47:42 INFO - 'suite': 'dromaeojs-e10s', 01:47:42 INFO - 'system_bits': '32', 01:47:42 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 01:47:42 INFO - 'title': 'talos-linux64-ix-021', 01:47:42 INFO - 'tooltool_cache': '/builds/tooltool_cache', 01:47:42 INFO - 'use_talos_json': True, 01:47:42 INFO - 'virtualenv_path': '/builds/slave/test-pgo/build/venv', 01:47:42 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 01:47:42 INFO - 'work_dir': 'build'} 01:47:42 INFO - ##### 01:47:42 INFO - ##### Running clobber step. 01:47:42 INFO - ##### 01:47:42 INFO - Running pre-action listener: _resource_record_pre_action 01:47:42 INFO - Running main action method: clobber 01:47:42 INFO - rmtree: /builds/slave/test-pgo/build 01:47:42 INFO - retry: Calling rmtree with args: ('/builds/slave/test-pgo/build',), kwargs: {}, attempt #1 01:47:43 INFO - Running post-action listener: _resource_record_post_action 01:47:43 INFO - ##### 01:47:43 INFO - ##### Running read-buildbot-config step. 01:47:43 INFO - ##### 01:47:43 INFO - Running pre-action listener: _resource_record_pre_action 01:47:43 INFO - Running main action method: read_buildbot_config 01:47:43 INFO - Using buildbot properties: 01:47:43 INFO - { 01:47:43 INFO - "project": "", 01:47:43 INFO - "product": "firefox", 01:47:43 INFO - "script_repo_revision": "production", 01:47:43 INFO - "builddir": "mozilla-aurora_ubuntu64_hw_test-dromaeojs-e10s", 01:47:43 INFO - "repository": "", 01:47:43 INFO - "buildername": "Ubuntu HW 12.04 x64 mozilla-aurora pgo talos dromaeojs-e10s", 01:47:43 INFO - "buildid": "20160307110832", 01:47:43 INFO - "pgo_build": "True", 01:47:43 INFO - "basedir": "/builds/slave/test-pgo", 01:47:43 INFO - "buildnumber": 120, 01:47:43 INFO - "slavename": "talos-linux64-ix-021", 01:47:43 INFO - "master": "http://buildbot-master104.bb.releng.scl3.mozilla.com:8201/", 01:47:43 INFO - "platform": "ubuntu64_hw", 01:47:43 INFO - "scheduler": "tests-mozilla-aurora-linux64-pgo-talos", 01:47:43 INFO - "branch": "mozilla-aurora", 01:47:43 INFO - "repo_path": "releases/mozilla-aurora", 01:47:43 INFO - "revision": "a06ac8e3220a", 01:47:43 INFO - "stage_platform": "linux64-pgo", 01:47:43 INFO - "builduid": "b0fbdd96eb50429c953c1789946b3361", 01:47:43 INFO - "slavebuilddir": "test" 01:47:43 INFO - } 01:47:43 INFO - Found installer url https://queue.taskcluster.net/v1/task/DXC_oMDVQqezRTaaZpA3IQ/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2. 01:47:43 INFO - Running post-action listener: _resource_record_post_action 01:47:43 INFO - ##### 01:47:43 INFO - ##### Running download-and-extract step. 01:47:43 INFO - ##### 01:47:43 INFO - Running pre-action listener: _resource_record_pre_action 01:47:43 INFO - Running main action method: download_and_extract 01:47:43 INFO - mkdir: /builds/slave/test-pgo/build/tests 01:47: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')]} 01:47:43 INFO - https://queue.taskcluster.net/v1/task/DXC_oMDVQqezRTaaZpA3IQ/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.test_packages.json matches https://queue.taskcluster.net 01:47:43 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/DXC_oMDVQqezRTaaZpA3IQ/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.test_packages.json 01:47:43 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/DXC_oMDVQqezRTaaZpA3IQ/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.test_packages.json 01:47:43 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/DXC_oMDVQqezRTaaZpA3IQ/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.test_packages.json to /builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.test_packages.json 01:47:43 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/DXC_oMDVQqezRTaaZpA3IQ/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.test_packages.json', 'file_name': '/builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.test_packages.json'}, attempt #1 01:47:45 INFO - Downloaded 1448 bytes. 01:47:45 INFO - Reading from file /builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.test_packages.json 01:47:45 INFO - Using the following test package requirements: 01:47:45 INFO - {u'common': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip'], 01:47:45 INFO - u'cppunittest': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 01:47:45 INFO - u'firefox-47.0a1.en-US.linux-x86_64.cppunittest.tests.zip'], 01:47:45 INFO - u'gtest': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 01:47:45 INFO - u'firefox-47.0a1.en-US.linux-x86_64.gtest.tests.zip'], 01:47:45 INFO - u'jittest': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 01:47:45 INFO - u'jsshell-linux-x86_64.zip'], 01:47:45 INFO - u'mochitest': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 01:47:45 INFO - u'firefox-47.0a1.en-US.linux-x86_64.mochitest.tests.zip'], 01:47:45 INFO - u'mozbase': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip'], 01:47:45 INFO - u'reftest': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 01:47:45 INFO - u'firefox-47.0a1.en-US.linux-x86_64.reftest.tests.zip'], 01:47:45 INFO - u'talos': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 01:47:45 INFO - u'firefox-47.0a1.en-US.linux-x86_64.talos.tests.zip'], 01:47:45 INFO - u'web-platform': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 01:47:45 INFO - u'firefox-47.0a1.en-US.linux-x86_64.web-platform.tests.zip'], 01:47:45 INFO - u'webapprt': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip'], 01:47:45 INFO - u'xpcshell': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 01:47:45 INFO - u'firefox-47.0a1.en-US.linux-x86_64.xpcshell.tests.zip']} 01:47:45 INFO - Downloading packages: [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 01:47:45 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 01:47:45 INFO - https://queue.taskcluster.net/v1/task/DXC_oMDVQqezRTaaZpA3IQ/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 01:47:45 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/DXC_oMDVQqezRTaaZpA3IQ/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip 01:47:45 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/DXC_oMDVQqezRTaaZpA3IQ/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip 01:47:45 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/DXC_oMDVQqezRTaaZpA3IQ/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 01:47:45 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/DXC_oMDVQqezRTaaZpA3IQ/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 01:47:56 INFO - Downloaded 23397998 bytes. 01:47:56 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'] 01:47:56 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 01:47:57 INFO - Return code: 0 01:47: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 01:47: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')]} 01:47:57 INFO - https://queue.taskcluster.net/v1/task/DXC_oMDVQqezRTaaZpA3IQ/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 01:47:57 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/DXC_oMDVQqezRTaaZpA3IQ/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip 01:47:57 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/DXC_oMDVQqezRTaaZpA3IQ/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip 01:47:57 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/DXC_oMDVQqezRTaaZpA3IQ/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 01:47:57 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/DXC_oMDVQqezRTaaZpA3IQ/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 01:48:08 INFO - Downloaded 23397998 bytes. 01:48:08 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'] 01:48:08 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 01:48:10 INFO - Return code: 0 01:48:10 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')]} 01:48:10 INFO - https://queue.taskcluster.net/v1/task/DXC_oMDVQqezRTaaZpA3IQ/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.talos.tests.zip matches https://queue.taskcluster.net 01:48:10 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/DXC_oMDVQqezRTaaZpA3IQ/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.talos.tests.zip 01:48:10 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/DXC_oMDVQqezRTaaZpA3IQ/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.talos.tests.zip 01:48:10 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/DXC_oMDVQqezRTaaZpA3IQ/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 01:48:10 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/DXC_oMDVQqezRTaaZpA3IQ/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 01:48:11 INFO - Downloaded 10803659 bytes. 01:48:11 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'] 01:48:11 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 01:48:12 INFO - Return code: 0 01:48:12 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 01:48:12 INFO - https://queue.taskcluster.net/v1/task/DXC_oMDVQqezRTaaZpA3IQ/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2 matches https://queue.taskcluster.net 01:48:12 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/DXC_oMDVQqezRTaaZpA3IQ/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2 01:48:12 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/DXC_oMDVQqezRTaaZpA3IQ/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2 01:48:12 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/DXC_oMDVQqezRTaaZpA3IQ/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 01:48:12 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/DXC_oMDVQqezRTaaZpA3IQ/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 01:48:13 INFO - Downloaded 56123602 bytes. 01:48:13 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/DXC_oMDVQqezRTaaZpA3IQ/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2 01:48:13 INFO - mkdir: /builds/slave/test-pgo/properties 01:48:13 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test-pgo/properties/build_url 01:48:13 INFO - Writing to file /builds/slave/test-pgo/properties/build_url 01:48:13 INFO - Contents: 01:48:13 INFO - build_url:https://queue.taskcluster.net/v1/task/DXC_oMDVQqezRTaaZpA3IQ/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2 01:48:14 INFO - Running post-action listener: _resource_record_post_action 01:48:14 INFO - Running post-action listener: set_extra_try_arguments 01:48:14 INFO - ##### 01:48:14 INFO - ##### Running populate-webroot step. 01:48:14 INFO - ##### 01:48:14 INFO - Running pre-action listener: _resource_record_pre_action 01:48:14 INFO - Running main action method: populate_webroot 01:48:14 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 01:48:14 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 01:48:14 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 01:48:14 INFO - '--tppagecycles', 01:48:14 INFO - '7'], 01:48:14 INFO - 'tests': ['tsvgm']}}, 01:48:14 INFO - 'suites': {'chromez': {'tests': ['tresize', 'tcanvasmark']}, 01:48:14 INFO - 'chromez-e10s': {'talos_options': ['--e10s'], 01:48:14 INFO - 'tests': ['tresize', 'tcanvasmark']}, 01:48:14 INFO - 'dromaeojs': {'tests': ['dromaeo_css', 'kraken']}, 01:48:14 INFO - 'dromaeojs-e10s': {'talos_options': ['--e10s'], 01:48:14 INFO - 'tests': ['dromaeo_css', 'kraken']}, 01:48:14 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 01:48:14 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 01:48:14 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 01:48:14 INFO - 'talos_options': ['--e10s'], 01:48:14 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 01:48:14 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 01:48:14 INFO - 'tests': ['damp', 'tps']}, 01:48:14 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 01:48:14 INFO - 'talos_options': ['--e10s'], 01:48:14 INFO - 'tests': ['damp', 'tps']}, 01:48:14 INFO - 'g3': {'tests': ['dromaeo_dom']}, 01:48:14 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 01:48:14 INFO - 'other': {'tests': ['a11yr', 01:48:14 INFO - 'ts_paint', 01:48:14 INFO - 'tpaint', 01:48:14 INFO - 'sessionrestore', 01:48:14 INFO - 'sessionrestore_no_auto_restore']}, 01:48:14 INFO - 'other-e10s': {'talos_options': ['--e10s'], 01:48:14 INFO - 'tests': ['a11yr', 01:48:14 INFO - 'ts_paint', 01:48:14 INFO - 'tpaint', 01:48:14 INFO - 'sessionrestore', 01:48:14 INFO - 'sessionrestore_no_auto_restore']}, 01:48:14 INFO - 'other-e10s_l64': {'talos_options': ['--e10s'], 01:48:14 INFO - 'tests': ['a11yr', 01:48:14 INFO - 'ts_paint', 01:48:14 INFO - 'tpaint', 01:48:14 INFO - 'sessionrestore', 01:48:14 INFO - 'sessionrestore_no_auto_restore']}, 01:48:14 INFO - 'other-e10s_nol64': {'talos_options': ['--e10s'], 01:48:14 INFO - 'tests': ['a11yr', 01:48:14 INFO - 'ts_paint', 01:48:14 INFO - 'tpaint', 01:48:14 INFO - 'sessionrestore', 01:48:14 INFO - 'sessionrestore_no_auto_restore']}, 01:48:14 INFO - 'other_l64': {'tests': ['a11yr', 01:48:14 INFO - 'ts_paint', 01:48:14 INFO - 'tpaint', 01:48:14 INFO - 'sessionrestore', 01:48:14 INFO - 'sessionrestore_no_auto_restore']}, 01:48:14 INFO - 'other_nol64': {'tests': ['a11yr', 01:48:14 INFO - 'ts_paint', 01:48:14 INFO - 'tpaint', 01:48:14 INFO - 'sessionrestore', 01:48:14 INFO - 'sessionrestore_no_auto_restore']}, 01:48:14 INFO - 'svgr': {'tests': ['tsvgx', 01:48:14 INFO - 'tsvgr_opacity', 01:48:14 INFO - 'tart', 01:48:14 INFO - 'tscrollx', 01:48:14 INFO - 'cart']}, 01:48:14 INFO - 'svgr-e10s': {'talos_options': ['--e10s'], 01:48:14 INFO - 'tests': ['tsvgx', 01:48:14 INFO - 'tsvgr_opacity', 01:48:14 INFO - 'tart', 01:48:14 INFO - 'tscrollx', 01:48:14 INFO - 'cart']}, 01:48:14 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 01:48:14 INFO - 'tests': ['tp5o']}, 01:48:14 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 01:48:14 INFO - 'talos_options': ['--e10s'], 01:48:14 INFO - 'tests': ['tp5o']}, 01:48:14 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 01:48:14 INFO - 'talos_options': ['--xperf_path', 01:48:14 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 01:48:14 INFO - 'tests': ['tp5n']}, 01:48:14 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 01:48:14 INFO - 'talos_options': ['--e10s', 01:48:14 INFO - '--xperf_path', 01:48:14 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 01:48:14 INFO - 'tests': ['tp5n']}}, 01:48:14 INFO - 'talos.zip': {'path': '', 01:48:14 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 01:48:14 INFO - Running post-action listener: _resource_record_post_action 01:48:14 INFO - ##### 01:48:14 INFO - ##### Running create-virtualenv step. 01:48:14 INFO - ##### 01:48:14 INFO - Running pre-action listener: _resource_record_pre_action 01:48:14 INFO - Running main action method: create_virtualenv 01:48:14 INFO - Creating virtualenv /builds/slave/test-pgo/build/venv 01:48:14 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 01:48:14 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test-pgo/build/venv 01:48:14 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 01:48:14 INFO - Using real prefix '/usr' 01:48:14 INFO - New python executable in /builds/slave/test-pgo/build/venv/bin/python 01:48:15 INFO - Installing distribute.............................................................................................................................................................................................done. 01:48:17 INFO - Installing pip.................done. 01:48:17 INFO - Return code: 0 01:48:17 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test-pgo/build/venv 01:48: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')]} 01:48:17 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 01:48:17 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 01:48: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')]} 01:48:17 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 01:48:17 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 01:48:17 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 0x7f55aba56f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x18508a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x191d6d0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x19ac920>, '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 0x19ad820>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x19adcb0>, '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': 'df17445c3590ff7897617a0e00000225-1457430363.597437-543552692', '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 01:48:17 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 01:48:17 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 01:48:17 INFO - Using env: {'DISPLAY': ':0', 01:48:17 INFO - 'HOME': '/home/cltbld', 01:48:17 INFO - 'LANG': 'en_US.UTF-8', 01:48:17 INFO - 'LANGUAGE': 'en_US:en', 01:48:17 INFO - 'LOGNAME': 'cltbld', 01:48:17 INFO - 'MAIL': '/var/mail/cltbld', 01:48:17 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 01:48:17 INFO - 'MOZ_NO_REMOTE': '1', 01:48:17 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 01:48:17 INFO - 'NO_EM_RESTART': '1', 01:48:17 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 01:48:17 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 01:48:17 INFO - 'PWD': '/builds/slave/test-pgo', 01:48:17 INFO - 'SHELL': '/bin/bash', 01:48:17 INFO - 'SHLVL': '1', 01:48:17 INFO - 'TERM': 'linux', 01:48:17 INFO - 'TMOUT': '86400', 01:48:17 INFO - 'USER': 'cltbld', 01:48:17 INFO - 'XDG_SESSION_COOKIE': 'df17445c3590ff7897617a0e00000225-1457430363.597437-543552692', 01:48:17 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 01:48:17 INFO - '_': '/tools/buildbot/bin/python'} 01:48:17 INFO - Ignoring indexes: https://pypi.python.org/simple/ 01:48:17 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 01:48:17 INFO - Cleaning up... 01:48:17 INFO - Return code: 0 01:48:17 INFO - Installing psutil>=0.7.1 into virtualenv /builds/slave/test-pgo/build/venv 01:48: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')]} 01:48:17 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 01:48:17 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 01:48: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')]} 01:48:17 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 01:48:17 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 01:48:17 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 0x7f55aba56f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x18508a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x191d6d0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x19ac920>, '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 0x19ad820>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x19adcb0>, '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': 'df17445c3590ff7897617a0e00000225-1457430363.597437-543552692', '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 01:48:17 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 01:48:17 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 01:48:17 INFO - Using env: {'DISPLAY': ':0', 01:48:17 INFO - 'HOME': '/home/cltbld', 01:48:17 INFO - 'LANG': 'en_US.UTF-8', 01:48:17 INFO - 'LANGUAGE': 'en_US:en', 01:48:17 INFO - 'LOGNAME': 'cltbld', 01:48:17 INFO - 'MAIL': '/var/mail/cltbld', 01:48:17 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 01:48:17 INFO - 'MOZ_NO_REMOTE': '1', 01:48:17 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 01:48:17 INFO - 'NO_EM_RESTART': '1', 01:48:17 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 01:48:17 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 01:48:17 INFO - 'PWD': '/builds/slave/test-pgo', 01:48:17 INFO - 'SHELL': '/bin/bash', 01:48:17 INFO - 'SHLVL': '1', 01:48:17 INFO - 'TERM': 'linux', 01:48:17 INFO - 'TMOUT': '86400', 01:48:17 INFO - 'USER': 'cltbld', 01:48:17 INFO - 'XDG_SESSION_COOKIE': 'df17445c3590ff7897617a0e00000225-1457430363.597437-543552692', 01:48:17 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 01:48:17 INFO - '_': '/tools/buildbot/bin/python'} 01:48:17 INFO - Ignoring indexes: https://pypi.python.org/simple/ 01:48:17 INFO - Downloading/unpacking psutil>=0.7.1 01:48:17 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 01:48:17 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 01:48:17 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 01:48:17 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 01:48:17 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 01:48:17 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 01:48:21 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/psutil/setup.py) egg_info for package psutil 01:48:21 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 01:48:21 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 01:48:21 INFO - Installing collected packages: psutil 01:48:21 INFO - Running setup.py install for psutil 01:48:21 INFO - building 'psutil._psutil_linux' extension 01:48:21 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 01:48:21 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 01:48:21 INFO - building 'psutil._psutil_posix' extension 01:48:21 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 01:48:21 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 01:48:21 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 01:48:21 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 01:48:21 INFO - Successfully installed psutil 01:48:21 INFO - Cleaning up... 01:48:21 INFO - Return code: 0 01:48:21 INFO - Installing mozsystemmonitor==0.0.0 into virtualenv /builds/slave/test-pgo/build/venv 01:48: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')]} 01:48:21 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 01:48:21 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 01:48: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')]} 01:48:21 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 01:48:21 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 01:48: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', '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 0x7f55aba56f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x18508a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x191d6d0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x19ac920>, '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 0x19ad820>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x19adcb0>, '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': 'df17445c3590ff7897617a0e00000225-1457430363.597437-543552692', '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 01:48: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', 'mozsystemmonitor==0.0.0'] in /builds/slave/test-pgo/build 01:48: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 mozsystemmonitor==0.0.0 01:48:21 INFO - Using env: {'DISPLAY': ':0', 01:48:21 INFO - 'HOME': '/home/cltbld', 01:48:21 INFO - 'LANG': 'en_US.UTF-8', 01:48:21 INFO - 'LANGUAGE': 'en_US:en', 01:48:21 INFO - 'LOGNAME': 'cltbld', 01:48:21 INFO - 'MAIL': '/var/mail/cltbld', 01:48:21 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 01:48:21 INFO - 'MOZ_NO_REMOTE': '1', 01:48:21 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 01:48:21 INFO - 'NO_EM_RESTART': '1', 01:48:21 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 01:48:21 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 01:48:21 INFO - 'PWD': '/builds/slave/test-pgo', 01:48:21 INFO - 'SHELL': '/bin/bash', 01:48:21 INFO - 'SHLVL': '1', 01:48:21 INFO - 'TERM': 'linux', 01:48:21 INFO - 'TMOUT': '86400', 01:48:21 INFO - 'USER': 'cltbld', 01:48:21 INFO - 'XDG_SESSION_COOKIE': 'df17445c3590ff7897617a0e00000225-1457430363.597437-543552692', 01:48:21 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 01:48:21 INFO - '_': '/tools/buildbot/bin/python'} 01:48:22 INFO - Ignoring indexes: https://pypi.python.org/simple/ 01:48:22 INFO - Downloading/unpacking mozsystemmonitor==0.0.0 01:48: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 01:48: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 01:48: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 01:48: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 01:48: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 01:48: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 01:48:26 INFO - Downloading mozsystemmonitor-0.0.tar.gz 01:48:26 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 01:48:26 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=0.7.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.0.0) 01:48:26 INFO - Installing collected packages: mozsystemmonitor 01:48:26 INFO - Running setup.py install for mozsystemmonitor 01:48:26 INFO - Successfully installed mozsystemmonitor 01:48:26 INFO - Cleaning up... 01:48:26 INFO - Return code: 0 01:48:26 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test-pgo/build/venv 01:48:26 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')]} 01:48:26 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 01:48:26 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 01:48:26 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')]} 01:48:26 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 01:48:26 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 01:48:26 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 0x7f55aba56f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x18508a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x191d6d0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x19ac920>, '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 0x19ad820>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x19adcb0>, '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': 'df17445c3590ff7897617a0e00000225-1457430363.597437-543552692', '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 01:48:26 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 01:48:26 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 01:48:26 INFO - Using env: {'DISPLAY': ':0', 01:48:26 INFO - 'HOME': '/home/cltbld', 01:48:26 INFO - 'LANG': 'en_US.UTF-8', 01:48:26 INFO - 'LANGUAGE': 'en_US:en', 01:48:26 INFO - 'LOGNAME': 'cltbld', 01:48:26 INFO - 'MAIL': '/var/mail/cltbld', 01:48:26 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 01:48:26 INFO - 'MOZ_NO_REMOTE': '1', 01:48:26 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 01:48:26 INFO - 'NO_EM_RESTART': '1', 01:48:26 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 01:48:26 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 01:48:26 INFO - 'PWD': '/builds/slave/test-pgo', 01:48:26 INFO - 'SHELL': '/bin/bash', 01:48:26 INFO - 'SHLVL': '1', 01:48:26 INFO - 'TERM': 'linux', 01:48:26 INFO - 'TMOUT': '86400', 01:48:26 INFO - 'USER': 'cltbld', 01:48:26 INFO - 'XDG_SESSION_COOKIE': 'df17445c3590ff7897617a0e00000225-1457430363.597437-543552692', 01:48:26 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 01:48:26 INFO - '_': '/tools/buildbot/bin/python'} 01:48:26 INFO - Ignoring indexes: https://pypi.python.org/simple/ 01:48:26 INFO - Downloading/unpacking blobuploader==1.2.4 01:48: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 01:48: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 01:48: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 01:48: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 01:48: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 01:48: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 01:48:32 INFO - Downloading blobuploader-1.2.4.tar.gz 01:48:32 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 01:48:32 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 01:48:32 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 01:48:32 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 01:48:32 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 01:48:32 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 01:48:32 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 01:48:32 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 01:48:33 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/requests/setup.py) egg_info for package requests 01:48:33 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 01:48:33 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 01:48:33 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 01:48:33 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 01:48:33 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 01:48:33 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 01:48:33 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 01:48:33 INFO - Downloading docopt-0.6.1.tar.gz 01:48:33 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/docopt/setup.py) egg_info for package docopt 01:48:33 INFO - Installing collected packages: blobuploader, requests, docopt 01:48:33 INFO - Running setup.py install for blobuploader 01:48:33 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 01:48:33 INFO - changing mode of /builds/slave/test-pgo/build/venv/bin/blobberc.py to 775 01:48:33 INFO - Running setup.py install for requests 01:48:34 INFO - Running setup.py install for docopt 01:48:34 INFO - Successfully installed blobuploader requests docopt 01:48:34 INFO - Cleaning up... 01:48:34 INFO - Return code: 0 01:48:34 INFO - Installing None into virtualenv /builds/slave/test-pgo/build/venv 01:48:34 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 01:48:34 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 01:48:34 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 01:48:34 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 01:48:34 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 01:48:34 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 01:48:34 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 0x7f55aba56f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x18508a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x191d6d0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x19ac920>, '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 0x19ad820>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x19adcb0>, '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': 'df17445c3590ff7897617a0e00000225-1457430363.597437-543552692', '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 01:48:34 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 01:48:34 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 01:48:34 INFO - Using env: {'DISPLAY': ':0', 01:48:34 INFO - 'HOME': '/home/cltbld', 01:48:34 INFO - 'LANG': 'en_US.UTF-8', 01:48:34 INFO - 'LANGUAGE': 'en_US:en', 01:48:34 INFO - 'LOGNAME': 'cltbld', 01:48:34 INFO - 'MAIL': '/var/mail/cltbld', 01:48:34 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 01:48:34 INFO - 'MOZ_NO_REMOTE': '1', 01:48:34 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 01:48:34 INFO - 'NO_EM_RESTART': '1', 01:48:34 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 01:48:34 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 01:48:34 INFO - 'PWD': '/builds/slave/test-pgo', 01:48:34 INFO - 'SHELL': '/bin/bash', 01:48:34 INFO - 'SHLVL': '1', 01:48:34 INFO - 'TERM': 'linux', 01:48:34 INFO - 'TMOUT': '86400', 01:48:34 INFO - 'USER': 'cltbld', 01:48:34 INFO - 'XDG_SESSION_COOKIE': 'df17445c3590ff7897617a0e00000225-1457430363.597437-543552692', 01:48:34 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 01:48:34 INFO - '_': '/tools/buildbot/bin/python'} 01:48:34 INFO - Ignoring indexes: https://pypi.python.org/simple/ 01:48:34 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/manifestparser 01:48:34 INFO - Running setup.py (path:/tmp/pip-KR6IAI-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/manifestparser 01:48:34 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozcrash 01:48:34 INFO - Running setup.py (path:/tmp/pip-ToDLLt-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozcrash 01:48:34 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdebug 01:48:34 INFO - Running setup.py (path:/tmp/pip-VmkUyw-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdebug 01:48:34 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdevice 01:48:34 INFO - Running setup.py (path:/tmp/pip-qhx6Jz-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdevice 01:48:34 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozfile 01:48:34 INFO - Running setup.py (path:/tmp/pip-4MqsiX-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozfile 01:48:35 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozhttpd 01:48:35 INFO - Running setup.py (path:/tmp/pip-pno6ZQ-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozhttpd 01:48:35 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinfo 01:48:35 INFO - Running setup.py (path:/tmp/pip-V2dljE-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinfo 01:48:35 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinstall 01:48:35 INFO - Running setup.py (path:/tmp/pip-8ehx9d-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinstall 01:48:35 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozleak 01:48:35 INFO - Running setup.py (path:/tmp/pip-rnSX6J-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozleak 01:48:35 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozlog 01:48:35 INFO - Running setup.py (path:/tmp/pip-QVVv1t-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozlog 01:48:35 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moznetwork 01:48:35 INFO - Running setup.py (path:/tmp/pip-IdpZ8Y-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moznetwork 01:48:35 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprocess 01:48:35 INFO - Running setup.py (path:/tmp/pip-ZaIDC2-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprocess 01:48:35 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprofile 01:48:35 INFO - Running setup.py (path:/tmp/pip-GpCf__-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprofile 01:48:35 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozrunner 01:48:35 INFO - Running setup.py (path:/tmp/pip-j68aq1-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozrunner 01:48:35 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 01:48:35 INFO - Running setup.py (path:/tmp/pip-oQsUDF-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 01:48:35 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moztest 01:48:35 INFO - Running setup.py (path:/tmp/pip-QNqkya-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moztest 01:48:35 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozversion 01:48:35 INFO - Running setup.py (path:/tmp/pip-7tCFwC-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozversion 01:48:35 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 01:48:35 INFO - Running setup.py install for manifestparser 01:48:36 INFO - Installing manifestparser script to /builds/slave/test-pgo/build/venv/bin 01:48:36 INFO - Running setup.py install for mozcrash 01:48:36 INFO - Running setup.py install for mozdebug 01:48:36 INFO - Running setup.py install for mozdevice 01:48:36 INFO - Installing sutini script to /builds/slave/test-pgo/build/venv/bin 01:48:36 INFO - Installing dm script to /builds/slave/test-pgo/build/venv/bin 01:48:36 INFO - Running setup.py install for mozfile 01:48:36 INFO - Running setup.py install for mozhttpd 01:48:36 INFO - Installing mozhttpd script to /builds/slave/test-pgo/build/venv/bin 01:48:36 INFO - Running setup.py install for mozinfo 01:48:36 INFO - Installing mozinfo script to /builds/slave/test-pgo/build/venv/bin 01:48:36 INFO - Running setup.py install for mozInstall 01:48:36 INFO - Installing moz_remove_from_system script to /builds/slave/test-pgo/build/venv/bin 01:48:36 INFO - Installing mozuninstall script to /builds/slave/test-pgo/build/venv/bin 01:48:36 INFO - Installing mozinstall script to /builds/slave/test-pgo/build/venv/bin 01:48:36 INFO - Installing moz_add_to_system script to /builds/slave/test-pgo/build/venv/bin 01:48:36 INFO - Running setup.py install for mozleak 01:48:36 INFO - Running setup.py install for mozlog 01:48:36 INFO - Installing structlog script to /builds/slave/test-pgo/build/venv/bin 01:48:36 INFO - Running setup.py install for moznetwork 01:48:37 INFO - Installing moznetwork script to /builds/slave/test-pgo/build/venv/bin 01:48:37 INFO - Running setup.py install for mozprocess 01:48:37 INFO - Running setup.py install for mozprofile 01:48:37 INFO - Installing mozprofile script to /builds/slave/test-pgo/build/venv/bin 01:48:37 INFO - Installing diff-profiles script to /builds/slave/test-pgo/build/venv/bin 01:48:37 INFO - Installing view-profile script to /builds/slave/test-pgo/build/venv/bin 01:48:37 INFO - Running setup.py install for mozrunner 01:48:37 INFO - Installing mozrunner script to /builds/slave/test-pgo/build/venv/bin 01:48:37 INFO - Running setup.py install for mozscreenshot 01:48:37 INFO - Running setup.py install for moztest 01:48:37 INFO - Running setup.py install for mozversion 01:48:37 INFO - Installing mozversion script to /builds/slave/test-pgo/build/venv/bin 01:48:37 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 01:48:37 INFO - Cleaning up... 01:48:37 INFO - Return code: 0 01:48:37 INFO - Installing None into virtualenv /builds/slave/test-pgo/build/venv 01:48:37 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 01:48:37 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 01:48:37 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 01:48:37 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 01:48:37 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 01:48:37 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 01:48:37 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 0x7f55aba56f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x18508a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x191d6d0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x19ac920>, '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 0x19ad820>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x19adcb0>, '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': 'df17445c3590ff7897617a0e00000225-1457430363.597437-543552692', '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 01:48:37 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 01:48:37 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 01:48:37 INFO - Using env: {'DISPLAY': ':0', 01:48:37 INFO - 'HOME': '/home/cltbld', 01:48:37 INFO - 'LANG': 'en_US.UTF-8', 01:48:37 INFO - 'LANGUAGE': 'en_US:en', 01:48:37 INFO - 'LOGNAME': 'cltbld', 01:48:37 INFO - 'MAIL': '/var/mail/cltbld', 01:48:37 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 01:48:37 INFO - 'MOZ_NO_REMOTE': '1', 01:48:37 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 01:48:37 INFO - 'NO_EM_RESTART': '1', 01:48:37 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 01:48:37 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 01:48:37 INFO - 'PWD': '/builds/slave/test-pgo', 01:48:37 INFO - 'SHELL': '/bin/bash', 01:48:37 INFO - 'SHLVL': '1', 01:48:37 INFO - 'TERM': 'linux', 01:48:37 INFO - 'TMOUT': '86400', 01:48:37 INFO - 'USER': 'cltbld', 01:48:37 INFO - 'XDG_SESSION_COOKIE': 'df17445c3590ff7897617a0e00000225-1457430363.597437-543552692', 01:48:37 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 01:48:37 INFO - '_': '/tools/buildbot/bin/python'} 01:48:37 INFO - Ignoring indexes: https://pypi.python.org/simple/ 01:48:37 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/manifestparser 01:48:37 INFO - Running setup.py (path:/tmp/pip-dJyXVN-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/manifestparser 01:48:37 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)) 01:48:37 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozcrash 01:48:37 INFO - Running setup.py (path:/tmp/pip-S7lqao-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozcrash 01:48:38 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash==0.17 from file:///builds/slave/test-pgo/build/tests/mozbase/mozcrash in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 2)) 01:48:38 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdebug 01:48:38 INFO - Running setup.py (path:/tmp/pip-cyzUQR-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdebug 01:48:38 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)) 01:48:38 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdevice 01:48:38 INFO - Running setup.py (path:/tmp/pip-EkPSXJ-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdevice 01:48:38 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)) 01:48:38 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozfile 01:48:38 INFO - Running setup.py (path:/tmp/pip-lBiPX6-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozfile 01:48:38 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)) 01:48:38 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozhttpd 01:48:38 INFO - Running setup.py (path:/tmp/pip-XlEqjY-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozhttpd 01:48:38 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)) 01:48:38 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinfo 01:48:38 INFO - Running setup.py (path:/tmp/pip-8w8ZGe-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinfo 01:48:38 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)) 01:48:38 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinstall 01:48:38 INFO - Running setup.py (path:/tmp/pip-Biyg6U-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinstall 01:48:38 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)) 01:48:38 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozleak 01:48:38 INFO - Running setup.py (path:/tmp/pip-N_0FH5-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozleak 01:48:38 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)) 01:48:38 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozlog 01:48:38 INFO - Running setup.py (path:/tmp/pip-DxlEEK-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozlog 01:48:38 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)) 01:48:38 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moznetwork 01:48:38 INFO - Running setup.py (path:/tmp/pip-Si_Qs2-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moznetwork 01:48:38 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)) 01:48:38 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprocess 01:48:38 INFO - Running setup.py (path:/tmp/pip-SOU7n7-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprocess 01:48:38 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)) 01:48:38 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprofile 01:48:38 INFO - Running setup.py (path:/tmp/pip-hp8ZZK-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprofile 01:48:38 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)) 01:48:38 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozrunner 01:48:38 INFO - Running setup.py (path:/tmp/pip-YiQLmK-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozrunner 01:48:38 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)) 01:48:38 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 01:48:38 INFO - Running setup.py (path:/tmp/pip-4cnaBx-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 01:48:38 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)) 01:48:38 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moztest 01:48:39 INFO - Running setup.py (path:/tmp/pip-1BQN07-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moztest 01:48:39 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)) 01:48:39 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozversion 01:48:39 INFO - Running setup.py (path:/tmp/pip-lEgy3v-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozversion 01:48:39 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)) 01:48:39 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.0 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from mozcrash==0.17->-r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 2)) 01:48:39 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.0 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from mozcrash==0.17->-r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 2)) 01:48:39 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)) 01:48:39 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)) 01:48:39 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)) 01:48:39 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.1->-r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 10)) 01:48:39 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 01:48:39 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 01:48:39 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 01:48:39 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 01:48:39 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 01:48:39 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 01:48:41 INFO - Downloading blessings-1.6.tar.gz 01:48:41 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/blessings/setup.py) egg_info for package blessings 01:48:41 INFO - Installing collected packages: blessings 01:48:41 INFO - Running setup.py install for blessings 01:48:44 INFO - Successfully installed blessings 01:48:44 INFO - Cleaning up... 01:48:44 INFO - Return code: 0 01:48:44 INFO - Done creating virtualenv /builds/slave/test-pgo/build/venv. 01:48:44 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'freeze'] 01:48:44 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip freeze 01:48:44 INFO - Reading from file tmpfile_stdout 01:48:44 INFO - Current package versions: 01:48:44 INFO - argparse == 1.2.1 01:48:44 INFO - blessings == 1.6 01:48:44 INFO - blobuploader == 1.2.4 01:48:44 INFO - docopt == 0.6.1 01:48:44 INFO - manifestparser == 1.1 01:48:44 INFO - mozInstall == 1.12 01:48:44 INFO - mozcrash == 0.17 01:48:44 INFO - mozdebug == 0.1 01:48:44 INFO - mozdevice == 0.48 01:48:44 INFO - mozfile == 1.2 01:48:44 INFO - mozhttpd == 0.7 01:48:44 INFO - mozinfo == 0.9 01:48:44 INFO - mozleak == 0.1 01:48:44 INFO - mozlog == 3.1 01:48:44 INFO - moznetwork == 0.27 01:48:44 INFO - mozprocess == 0.22 01:48:44 INFO - mozprofile == 0.28 01:48:44 INFO - mozrunner == 6.11 01:48:44 INFO - mozscreenshot == 0.1 01:48:44 INFO - mozsystemmonitor == 0.0 01:48:44 INFO - moztest == 0.7 01:48:44 INFO - mozversion == 1.4 01:48:44 INFO - psutil == 3.1.1 01:48:44 INFO - requests == 1.2.3 01:48:44 INFO - wsgiref == 0.1.2 01:48:44 INFO - Installing None into virtualenv /builds/slave/test-pgo/build/venv 01:48:44 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')]} 01:48:44 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 01:48:44 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 01:48:44 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')]} 01:48:44 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 01:48:44 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 01:48:44 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 0x7f55aba56f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x18508a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x191d6d0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x19ac920>, '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 0x19ad820>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x19adcb0>, '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': 'df17445c3590ff7897617a0e00000225-1457430363.597437-543552692', '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 01:48:44 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 01:48:44 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 01:48:44 INFO - Using env: {'DISPLAY': ':0', 01:48:44 INFO - 'HOME': '/home/cltbld', 01:48:44 INFO - 'LANG': 'en_US.UTF-8', 01:48:44 INFO - 'LANGUAGE': 'en_US:en', 01:48:44 INFO - 'LOGNAME': 'cltbld', 01:48:44 INFO - 'MAIL': '/var/mail/cltbld', 01:48:44 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 01:48:44 INFO - 'MOZ_NO_REMOTE': '1', 01:48:44 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 01:48:44 INFO - 'NO_EM_RESTART': '1', 01:48:44 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 01:48:44 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 01:48:44 INFO - 'PWD': '/builds/slave/test-pgo', 01:48:44 INFO - 'SHELL': '/bin/bash', 01:48:44 INFO - 'SHLVL': '1', 01:48:44 INFO - 'TERM': 'linux', 01:48:44 INFO - 'TMOUT': '86400', 01:48:44 INFO - 'USER': 'cltbld', 01:48:44 INFO - 'XDG_SESSION_COOKIE': 'df17445c3590ff7897617a0e00000225-1457430363.597437-543552692', 01:48:44 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 01:48:44 INFO - '_': '/tools/buildbot/bin/python'} 01:48:44 INFO - Ignoring indexes: https://pypi.python.org/simple/ 01:48:44 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)) 01:48:44 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)) 01:48:44 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)) 01:48:44 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)) 01:48:44 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)) 01:48:44 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)) 01:48:44 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)) 01:48:44 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)) 01:48:44 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)) 01:48:44 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)) 01:48:44 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)) 01:48:44 INFO - Cleaning up... 01:48:44 INFO - Return code: 0 01:48:44 INFO - Installing jsonschema into virtualenv /builds/slave/test-pgo/build/venv 01:48:44 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')]} 01:48:44 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 01:48:44 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 01:48:44 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')]} 01:48:44 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 01:48:44 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 01:48:44 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 0x7f55aba56f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x18508a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x191d6d0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x19ac920>, '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 0x19ad820>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x19adcb0>, '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': 'df17445c3590ff7897617a0e00000225-1457430363.597437-543552692', '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 01:48:44 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 01:48:44 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 01:48:44 INFO - Using env: {'DISPLAY': ':0', 01:48:44 INFO - 'HOME': '/home/cltbld', 01:48:44 INFO - 'LANG': 'en_US.UTF-8', 01:48:44 INFO - 'LANGUAGE': 'en_US:en', 01:48:44 INFO - 'LOGNAME': 'cltbld', 01:48:44 INFO - 'MAIL': '/var/mail/cltbld', 01:48:44 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 01:48:44 INFO - 'MOZ_NO_REMOTE': '1', 01:48:44 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 01:48:44 INFO - 'NO_EM_RESTART': '1', 01:48:44 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 01:48:44 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 01:48:44 INFO - 'PWD': '/builds/slave/test-pgo', 01:48:44 INFO - 'SHELL': '/bin/bash', 01:48:44 INFO - 'SHLVL': '1', 01:48:44 INFO - 'TERM': 'linux', 01:48:44 INFO - 'TMOUT': '86400', 01:48:44 INFO - 'USER': 'cltbld', 01:48:44 INFO - 'XDG_SESSION_COOKIE': 'df17445c3590ff7897617a0e00000225-1457430363.597437-543552692', 01:48:44 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 01:48:44 INFO - '_': '/tools/buildbot/bin/python'} 01:48:45 INFO - Ignoring indexes: https://pypi.python.org/simple/ 01:48:45 INFO - Downloading/unpacking jsonschema 01:48:45 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 01:48:45 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 01:48:45 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 01:48:45 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 01:48:45 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 01:48:45 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 01:48:46 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 01:48:46 INFO - Downloading/unpacking functools32 (from jsonschema) 01:48:46 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 01:48:46 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 01:48:46 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 01:48:46 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 01:48:46 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 01:48:46 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 01:48:47 INFO - Downloading functools32-3.2.3-2.tar.gz 01:48:47 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/functools32/setup.py) egg_info for package functools32 01:48:47 INFO - warning: no files found matching '*.txt' 01:48:47 INFO - no previously-included directories found matching 'build' 01:48:47 INFO - no previously-included directories found matching 'dist' 01:48:47 INFO - no previously-included directories found matching '.git*' 01:48:47 INFO - Installing collected packages: jsonschema, functools32 01:48:47 INFO - Running setup.py install for functools32 01:48:47 INFO - warning: no files found matching '*.txt' 01:48:47 INFO - no previously-included directories found matching 'build' 01:48:47 INFO - no previously-included directories found matching 'dist' 01:48:47 INFO - no previously-included directories found matching '.git*' 01:48:47 INFO - Successfully installed jsonschema functools32 01:48:47 INFO - Cleaning up... 01:48:47 INFO - Return code: 0 01:48:47 INFO - Installing flake8 into virtualenv /builds/slave/test-pgo/build/venv 01:48:47 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 01:48:47 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 01:48:47 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 01:48:47 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 01:48:47 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 01:48:47 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 01:48:47 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 0x7f55aba56f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x18508a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x191d6d0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x19ac920>, '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 0x19ad820>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x19adcb0>, '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': 'df17445c3590ff7897617a0e00000225-1457430363.597437-543552692', '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 01:48:47 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 01:48:47 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 01:48:47 INFO - Using env: {'DISPLAY': ':0', 01:48:47 INFO - 'HOME': '/home/cltbld', 01:48:47 INFO - 'LANG': 'en_US.UTF-8', 01:48:47 INFO - 'LANGUAGE': 'en_US:en', 01:48:47 INFO - 'LOGNAME': 'cltbld', 01:48:47 INFO - 'MAIL': '/var/mail/cltbld', 01:48:47 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 01:48:47 INFO - 'MOZ_NO_REMOTE': '1', 01:48:47 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 01:48:47 INFO - 'NO_EM_RESTART': '1', 01:48:47 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 01:48:47 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 01:48:47 INFO - 'PWD': '/builds/slave/test-pgo', 01:48:47 INFO - 'SHELL': '/bin/bash', 01:48:47 INFO - 'SHLVL': '1', 01:48:47 INFO - 'TERM': 'linux', 01:48:47 INFO - 'TMOUT': '86400', 01:48:47 INFO - 'USER': 'cltbld', 01:48:47 INFO - 'XDG_SESSION_COOKIE': 'df17445c3590ff7897617a0e00000225-1457430363.597437-543552692', 01:48:47 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 01:48:47 INFO - '_': '/tools/buildbot/bin/python'} 01:48:47 INFO - Ignoring indexes: https://pypi.python.org/simple/ 01:48:47 INFO - Downloading/unpacking flake8 01:48:47 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 01:48:47 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 01:48:47 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 01:48:47 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 01:48:47 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 01:48:47 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 01:48:49 INFO - Downloading flake8-2.5.0-py2.py3-none-any.whl 01:48:49 INFO - Downloading/unpacking mccabe>=0.2.1,<0.4 (from flake8) 01:48:49 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 01:48:49 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 01:48:49 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 01:48:49 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 01:48:49 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 01:48:49 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 01:48:49 INFO - Downloading mccabe-0.3.1-py2.py3-none-any.whl 01:48:49 INFO - Downloading/unpacking pyflakes>=0.8.1,<1.1 (from flake8) 01:48:49 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 01:48:49 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 01:48:49 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 01:48:49 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 01:48:49 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 01:48:49 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 01:48:50 INFO - Downloading/unpacking pep8>=1.5.7,!=1.6.0,!=1.6.1,!=1.6.2 (from flake8) 01:48:50 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 01:48:50 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 01:48:50 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 01:48:50 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 01:48:50 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 01:48:50 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 01:48:50 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/pep8/setup.py) egg_info for package pep8 01:48:50 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 01:48:50 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 01:48:50 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 01:48:50 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 01:48:50 INFO - no previously-included directories found matching 'docs/_build' 01:48:50 INFO - Installing collected packages: flake8, mccabe, pyflakes, pep8 01:48:50 INFO - Running setup.py install for pep8 01:48:50 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 01:48:50 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 01:48:50 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 01:48:50 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 01:48:50 INFO - no previously-included directories found matching 'docs/_build' 01:48:50 INFO - Installing pep8 script to /builds/slave/test-pgo/build/venv/bin 01:48:50 INFO - Successfully installed flake8 mccabe pyflakes pep8 01:48:50 INFO - Cleaning up... 01:48:50 INFO - Return code: 0 01:48:50 INFO - Running post-action listener: _resource_record_post_action 01:48:50 INFO - Running post-action listener: _start_resource_monitoring 01:48:50 INFO - Starting resource monitoring. 01:48:50 INFO - ##### 01:48:50 INFO - ##### Running install step. 01:48:50 INFO - ##### 01:48:50 INFO - Running pre-action listener: _resource_record_pre_action 01:48:50 INFO - Running main action method: install 01:48:50 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'freeze'] 01:48:50 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip freeze 01:48:50 INFO - Reading from file tmpfile_stdout 01:48:50 INFO - Detecting whether we're running mozinstall >=1.0... 01:48:50 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/mozinstall', '-h'] 01:48:50 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/mozinstall -h 01:48:50 INFO - Reading from file tmpfile_stdout 01:48:50 INFO - Output received: 01:48:50 INFO - Usage: mozinstall [options] installer 01:48:50 INFO - Options: 01:48:50 INFO - -h, --help show this help message and exit 01:48:50 INFO - -d DEST, --destination=DEST 01:48:50 INFO - Directory to install application into. [default: 01:48:50 INFO - "/builds/slave/test-pgo"] 01:48:50 INFO - --app=APP Application being installed. [default: firefox] 01:48:50 INFO - mkdir: /builds/slave/test-pgo/build/application 01:48:50 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'] 01:48:50 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 01:49:07 INFO - Reading from file tmpfile_stdout 01:49:07 INFO - Output received: 01:49:07 INFO - /builds/slave/test-pgo/build/application/firefox/firefox 01:49:07 INFO - Running post-action listener: _resource_record_post_action 01:49:07 INFO - ##### 01:49:07 INFO - ##### Running run-tests step. 01:49:07 INFO - ##### 01:49:07 INFO - Running pre-action listener: _resource_record_pre_action 01:49:07 INFO - Running main action method: run_tests 01:49:07 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/python', '--version'] 01:49:07 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/python --version 01:49:07 INFO - Python 2.7.3 01:49:07 INFO - Return code: 0 01:49:07 INFO - grabbing minidump binary from tooltool 01:49:07 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')]} 01:49:07 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 0x19ac920>, '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 0x19ad820>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x19adcb0>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test-pgo/build', 'privileged': False}, attempt #1 01:49:07 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 01:49:07 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 01:49:07 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 01:49:07 INFO - Return code: 0 01:49:07 INFO - Chmoding /builds/slave/test-pgo/build/linux64-minidump_stackwalk to 0755 01:49:07 INFO - mkdir: /builds/slave/test-pgo/build/blobber_upload_dir 01:49:07 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test-pgo/build/blobber_upload_dir 01:49:07 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test-pgo/build/linux64-minidump_stackwalk 01:49:07 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test-pgo/build/blobber_upload_dir 01:49:07 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/flake8', '/builds/slave/test-pgo/build/tests/talos/talos'] 01:49:07 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/flake8 /builds/slave/test-pgo/build/tests/talos/talos 01:49:08 INFO - Return code: 0 01:49:08 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/python', '/builds/slave/test-pgo/build/tests/talos/talos/run_tests.py', '--branchName', 'Mozilla-Aurora', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test-pgo/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/DXC_oMDVQqezRTaaZpA3IQ/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-021', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log', '--log-raw=/builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs-e10s_raw.log'] in /builds/slave/test-pgo/build 01:49:08 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/python /builds/slave/test-pgo/build/tests/talos/talos/run_tests.py --branchName Mozilla-Aurora --suite dromaeojs-e10s --executablePath /builds/slave/test-pgo/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/DXC_oMDVQqezRTaaZpA3IQ/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-021 --webServer localhost --log-tbpl-level=debug --log-errorsummary=/builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log --log-raw=/builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs-e10s_raw.log 01:49:08 INFO - Using env: {'DISPLAY': ':0', 01:49:08 INFO - 'HOME': '/home/cltbld', 01:49:08 INFO - 'LANG': 'en_US.UTF-8', 01:49:08 INFO - 'LANGUAGE': 'en_US:en', 01:49:08 INFO - 'LOGNAME': 'cltbld', 01:49:08 INFO - 'MAIL': '/var/mail/cltbld', 01:49:08 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test-pgo/build/blobber_upload_dir', 01:49:08 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test-pgo/build/linux64-minidump_stackwalk', 01:49:08 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 01:49:08 INFO - 'MOZ_NO_REMOTE': '1', 01:49:08 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test-pgo/build/blobber_upload_dir', 01:49:08 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 01:49:08 INFO - 'NO_EM_RESTART': '1', 01:49:08 INFO - 'PATH': '/builds/slave/test-pgo/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 01:49:08 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 01:49:08 INFO - 'PWD': '/builds/slave/test-pgo', 01:49:08 INFO - 'PYTHONPATH': '/builds/slave/test-pgo/build/tests/talos', 01:49:08 INFO - 'SHELL': '/bin/bash', 01:49:08 INFO - 'SHLVL': '1', 01:49:08 INFO - 'TERM': 'linux', 01:49:08 INFO - 'TMOUT': '86400', 01:49:08 INFO - 'USER': 'cltbld', 01:49:08 INFO - 'XDG_SESSION_COOKIE': 'df17445c3590ff7897617a0e00000225-1457430363.597437-543552692', 01:49:08 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 01:49:08 INFO - '_': '/tools/buildbot/bin/python'} 01:49:08 INFO - Calling ['/builds/slave/test-pgo/build/venv/bin/python', '/builds/slave/test-pgo/build/tests/talos/talos/run_tests.py', '--branchName', 'Mozilla-Aurora', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test-pgo/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/DXC_oMDVQqezRTaaZpA3IQ/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-021', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log', '--log-raw=/builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs-e10s_raw.log'] with output_timeout 3600 01:49:08 INFO - mozversion application_buildid: 20160307110832 01:49:08 INFO - mozversion application_changeset: a06ac8e3220aa7bb49f5b755936078772a2b7464 01:49:08 INFO - mozversion application_display_name: Nightly 01:49:08 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 01:49:08 INFO - mozversion application_name: Firefox 01:49:08 INFO - mozversion application_remotingname: firefox 01:49:08 INFO - mozversion application_repository: https://hg.mozilla.org/releases/mozilla-aurora 01:49:08 INFO - mozversion application_vendor: Mozilla 01:49:08 INFO - mozversion application_version: 47.0a1 01:49:08 INFO - mozversion platform_buildid: 20160307110832 01:49:08 INFO - mozversion platform_changeset: a06ac8e3220aa7bb49f5b755936078772a2b7464 01:49:08 INFO - mozversion platform_repository: https://hg.mozilla.org/releases/mozilla-aurora 01:49:08 INFO - mozversion platform_version: 47.0a1 01:49:08 INFO - using testdate: 1457430548 01:49:08 INFO - actual date: 1457430548 01:49:08 INFO - starting webserver on 'localhost:50693' 01:49:08 INFO - SUITE-START | Running 2 tests 01:49:08 INFO - TEST-START | dromaeo_css 01:49:08 INFO - operating with platform_type : linux_ 01:49:08 INFO - Initialising browser for dromaeo_css test... 01:49:08 INFO - TEST-INFO | started process 624 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpeIvPN7/profile http://localhost:50693/getInfo.html) 01:49:13 INFO - PROCESS | 624 | 01:49:13 INFO - PROCESS | 624 | (process:704): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 01:49:13 INFO - PROCESS | 624 | __metrics Screen width/height:1600/1200 01:49:13 INFO - PROCESS | 624 | colorDepth:24 01:49:13 INFO - PROCESS | 624 | Browser inner width/height: 1024/697 01:49:13 INFO - PROCESS | 624 | __metrics 01:49:14 ERROR - PROCESS | 624 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 2849: TypeError: this.tabs is undefined 01:49:15 INFO - TEST-INFO | 624: exit 0 01:49:15 INFO - Browser initialized. 01:49:15 INFO - Running cycle 1/1 for dromaeo_css test... 01:49:15 INFO - TEST-INFO | started process 756 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpeIvPN7/profile -tp file:/builds/slave/test-pgo/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 01:49:17 INFO - PROCESS | 756 | 01:49:17 INFO - PROCESS | 756 | (process:817): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 01:49:27 INFO - PROCESS | 756 | RSS: Main: 161218560 01:49:27 INFO - PROCESS | 756 | 01:50:17 INFO - PROCESS | 756 | 1457430617135 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] 01:52:26 INFO - PROCESS | 756 | Cycle 1(1): loaded http://localhost:50693/tests/dromaeo/cssquery-dojo.html (next: http://localhost:50693/tests/dromaeo/cssquery-ext.html) 01:52:27 INFO - PROCESS | 756 | RSS: Main: 169881600 01:52:27 INFO - PROCESS | 756 | 01:55:29 INFO - PROCESS | 756 | Cycle 1(1): loaded http://localhost:50693/tests/dromaeo/cssquery-ext.html (next: http://localhost:50693/tests/dromaeo/cssquery-jquery.html) 01:55:29 INFO - PROCESS | 756 | RSS: Main: 165388288 01:55:29 INFO - PROCESS | 756 | 01:58:31 INFO - PROCESS | 756 | Cycle 1(1): loaded http://localhost:50693/tests/dromaeo/cssquery-jquery.html (next: http://localhost:50693/tests/dromaeo/cssquery-mootools.html) 01:58:32 INFO - PROCESS | 756 | RSS: Main: 166842368 01:58:32 INFO - PROCESS | 756 | 02:01:33 INFO - PROCESS | 756 | Cycle 1(1): loaded http://localhost:50693/tests/dromaeo/cssquery-mootools.html (next: http://localhost:50693/tests/dromaeo/cssquery-prototype.html) 02:01:34 INFO - PROCESS | 756 | RSS: Main: 164339712 02:01:34 INFO - PROCESS | 756 | 02:04:36 INFO - PROCESS | 756 | Cycle 1(1): loaded http://localhost:50693/tests/dromaeo/cssquery-prototype.html (next: http://localhost:50693/tests/dromaeo/cssquery-yui.html) 02:04:37 INFO - PROCESS | 756 | RSS: Main: 166191104 02:04:37 INFO - PROCESS | 756 | 02:07:40 INFO - PROCESS | 756 | Cycle 1(1): loaded http://localhost:50693/tests/dromaeo/cssquery-yui.html (next: http://localhost:50693/tests/dromaeo/cssquery-dojo.html) 02:07:40 INFO - PROCESS | 756 | RSS: Main: 168697856 02:07:40 INFO - PROCESS | 756 | 02:07:40 INFO - PROCESS | 756 | __start_tp_report 02:07:40 INFO - PROCESS | 756 | _x_x_mozilla_page_load 02:07:40 INFO - PROCESS | 756 | _x_x_mozilla_page_load_details 02:07:40 INFO - PROCESS | 756 | |i|pagename|runs| 02:07:40 INFO - PROCESS | 756 | |0;dojo.html;3219.983900080499;3250.398676244895;3282.7209687176587;3297.5713157289556;3309.2388750587365;5171.0692075426405;5318.3617965844105;5361.329833770778;5362.490563396476;5372.059889519328;5261.76322065507;5287.312649355588;5318.840434786953;5411.188321751739;5413.26920865683;4847.757612119389;4893.363862697862;4909.0672772173175;4962.578180854632;5040.1179793535985;4797.544233297831;5032.345795046657;5033.068882256776;5051.419086805009;5063.544281014708;4761.833335833264;4791.520847915215;4834.879128021792;4918.311436398907;4931.2603109533675;4883.316335713003;4887.853364399074;4913.115639184945;4914.14002549556;4979.651424400294;4802.687825291345;4853.757312134415;4879.951200487985;4897.730624815634;4957.925631115536;5036.093503169428;5085.466026067246;5097.929434818692;5123.641345105844;5151.021305951857;5711.485966263015;5749.3388260350175;5765.452282033242;5765.884682306372;5769.9711501442225;5677.659340439587;5767.221425107598;5768.769249230026;5771.451712087345;5815.331236907768;5390.811321603725;5427.158790387417;5456.83629491112;5494.148406996922;5503.972480137573;5722.198892155102;5727.31272247333;5737.512311453574;5738.110592858114;5746.569007324468;5452;5541.2796336476;5542.63972841764;5542.972285138549;5638.605297629127;5728.054870946247;5728.312602487728;5777.595568310178;5778.393268706809;5810.767569297265;5586.078297080936;5625.71871406428;5698.373178950312;5748.540116790647;5756.798512052058;5657.4908258256955;5658.858528536737;5704.828855134353;5710.371859095496;5727.341355744059;4299.634531064832;4332.956670433318;4358.4769827620885;4358.825646974085;4367.825286988548;3846.3845784674318;3847.711421643388;3851.9422208666892;3862.7682339059747;3889.8833035008997;5286.603504737083;5305.681659100466;5320.787168513216;5324.041672498987;5344;5614.466625670555;5759.913601295984;5787.074068149076;5801.361850196475;5860.2967643883;5309.973450132725;5322.28149199853;5327.413984461706;5333.173358129496;5350.9732451337495;4737.052589482118;4742.549457801503;4749.35883655702;4764.0471905619015;4790.233562629963;6010.188624535632;6035.637861728223;6037.577369584087;6044.425779550936;6104.481119104837;5739.167820665896;5750.6837123958585;5751.683657398883;5759.424057594207;5763.106718458645;5820.388859169896;5952.196453478725;6016.458518733335;6016.639001659914;6030.517558595389;5530.723463826712;5559.416261292506;5563.860903477445;5570.415106413769;5619.438056194348;5722.8569285766525;5757.251557297692;5762.798302059407;5765.077587585966;5784.392638772868;5510.696911669736;5517.062099443185;5518.724063796874;5588.552915766648;5610.5231055360755;5497.642653227527;5538.224648549126;5550.861228469321;5559.499645031805;5599.076152434803;5440.075187218262;5517.062099443024;5535.252740880091;5546.4453554644215;5551.167324901297;5455.454454554513;5598.804041858515;5625.46558076982;5640.971795140998;5666.320041595035;5383.0579648562125;5413.188021796762;5445.673259604437;5454.754536045967;5467.644603100785 02:07:40 INFO - PROCESS | 756 | |1;ext.html;511.442527644867;523.4765234765234;528.1575886461096;535.5661913849782;572.2046355565761;38855.41716874249;39252.60747392525;39539.61611343604;39568.60431395685;39593.80203098988;40368.59631403685;41034.79482602583;41140;41294.58705412945;41296;8543.658253669846;8727.432716873414;8738.432001919886;8744.081871403507;8767.693130740425;8566.400351975364;8698.39111262212;8706.347023973196;8712.651493940235;8724.08397118303;8684.652613895469;8797.29621630268;8807.64769409223;8811.206991370775;8834.646614135427;8599.914000860004;8601.827963440759;8654.09132041133;8679.696210632661;8692.869606955901;8450.87323690145;8646.48121112729;8690.913090869073;8711.433756805787;8727.432716873447;37150.814245928865;37517.437238441446;37528;37640.62359376399;37652.81173594115;3326.185084654251;3329.417351963397;3420.538227339327;3434.5706786651667;3597.0647631615966;28583.857080714464;30406.84796576025;30711.69288307133;31852.522212166838;31939.201519961953;3629.891103266906;3660.359437098497;3781.4894989176382;3796.791176485292;3831.1571454280015;272433;273065;273989;274394;275479;60095.39904600986;60573.39426605678;60833;60845.39154608486;60914.69542652259;68054.3194568058;68167;69124.65437672779;69286;69450;16215.513534593982;16292.34830606786;16392.426265080663;16394.590135246715;16413.753793693104;12322.81515777264;12399.318037507843;12406.441710122886;12406.875931240573;12409.689757756129;20535.28126515565;21117.472063198544;21434.57130857374;21472.57054858894;21502.677459838116;8018.2359880826125;8272.83454330922;8285.62714677841;8383.790405239917;8487.151284871587;885.8272636835884;1027.8201314769885;1040.458961340099;1060.612876300145;1149.4654985431648;29317.26706832346;29484.11547653574;29922.251943701147;30245.97540246002;30272.54591181134;1052.7947050325113;1062.6387028410377;1075.2365820267698;1115.8437818705388;1167.2062997161843;15197;15579.688406231811;15615.219239038002;15768.76346854798;15874.52376428709;306948;308021;309922;310634;313620;54008.45991540113;54508;54793.72603137039;54931.725341373036;55230.72384638051;1295.4688577683105;1309.5285697149018;1343.8521762606106;1350.8378994520524;1354.525915929417;28160;29427.264318392212;29595.408091837613;29687.406251875273;29732.256693582833;49144.50855491399;49410.752946235036;49503.75248123737;49648;49721.75139124281;280904;285578;287476;289181;289213;33357.831006055356;33669.83165084159;33732.83133584316;33785.83107084449;33788.66211337855;46108;46209;46723.76638116788;46838.76580617075;47469;37555.25619917091;38504;39359.2128157441;39481.40777888276;39521.407178892914;38073;38131.42802858015;38976.2204755909;39020.2195956085;39429.605703943744;37352.319145637965;37629;38262.80868595639;38437;38523.22953540969;32605.003396874457;34501;34575.481367780005;34967.95096147119;35081.82459087688;27734.5839812407;29014.023047781604;29045.12864614065;29125.85437072801;29289.560656590595 02:07:40 INFO - PROCESS | 756 | |2;jquery.html;349.48451034723803;349.662575614532;353.28812442927506;354.2348527181286;356.36033320190273;16796;16945.491635250946;16982.15089245539;17262.136893155322;17321.22054507547;16145;16545.42091026814;16559.08925009127;16740.41408550701;16908.323667053304;5229.529342359187;5233.21501774733;5409.486098820606;5428.185772134172;5461.617686761928;5320.334958130234;5381.058314794915;5398.730063496829;5411.918821217685;5443.292371991635;5154.92267615986;5316.38861530925;5338.386085600147;5377.274068000809;5420.186971954199;5295;5301.674581354661;5322.281491998569;5344.278522399484;5363.115086010823;4706.670533062687;4719.764011799431;4722.83470078549;4722.952770472286;4723.102610503994;20365.287214947406;20466.897665511726;21059.5788084239;21089.050992705364;21168.259110931045;2176.7823217678106;2192.8903554822195;2204.515006698524;2234.8100411465043;2374.6200607902824;13079.803802942963;13498.662533436644;13534.932325338408;13540.593782186452;13806.309684515834;1903.9524011899675;1916.2335065973582;1997.5838085342339;2033.593281343737;2067.059487933002;63219.683901580654;67438.32561674419;67952;68080.31919680838;68242;10308.793824123626;10458.320209186379;10589.894101058891;10643.52104155315;10766.56933722658;13869.306534673226;13876.098053626481;13896.791548126786;13948.511802086878;13981;7666.769996900102;7707.4604777666145;7710.7686769397005;7839.09850367215;7863.174366691529;7466.70133194677;7519;7562.205968373351;7590.506617069983;7601.695932162762;4432.180046691308;4612.469565999953;4621.23749581322;4640.559146881041;4713.740744259098;1824.6806808808406;1847.4919397165618;1875.5711353796867;1891.4367146003347;1905.8380037696675;879.3097418526426;895.7805337692176;909.9454032757923;947.6351604632129;966.6568368229318;15649;16254.268557914686;16769.580760480843;17297.740533892003;17414.303427862997;899.4108858697564;946.5551190940247;968.4867020479157;981.8625392445064;988.945607991553;9706.320557561045;9815.950920245496;9874.703758887244;9947.502624868872;10094.141997930112;438220;466093;467734;471353;480698;71010.28989710141;71010.64494677597;72515.2748472519;72892.27107728961;73008.63495682487;988.2094324540338;1003.3227571389428;1028.7685270814006;1033.6847261585137;1040.2770074798093;14559.781603276171;14966.40134394612;15038.849611503745;15074.246287685792;15359.308831102404;30698.386032278784;31228.53157202689;31747.206319841265;31824.681753182173;31834;40783.388249175696;42186;43999.78000110107;44211;44574.77712611416;8180.345572354078;8288.58557072156;8325.83348333042;10557.52491137916;10971.725706857393;12875;12961.675958101123;12976.286304252979;13164.275964822027;13266.403011864682;10903;11252;11309.264897781617;11336.093112551142;11414.372209528556;11517.712057198638;11661.300321980709;11683.591074312699;11918.093105103142;11925.582604608797;11211.495482703134;11643.708907277385;11660.41697915084;11856.940715296369;11895.405229738652;11130.387828669502;11230.270032447865;11347.14896382791;11420.657380278604;11511;11686.071798153209;11694.356810375171;11731.824022639497;11749.177557570887;11861.05111591088 02:07:40 INFO - PROCESS | 756 | |3;mootools.html;1508.1026789060506;1524.8780097592194;1673.790776152981;1793.6950718377875;1836.2104295153079;6897.5861448313135;7506;7709.768706938787;7891.842163156741;7893.171217022216;7590.468667193299;7678.347340476066;7736.458447908649;7752.7674169774855;7771.145174030852;2308.722953245613;2326.8254880883915;2336.4626135988733;2336.6495025746103;2338.6141286687675;2267.761885002076;2277.0664027748626;2333.9847166482637;2339.0526836631107;2344.249840051176;2294.403455101669;2301.551197516485;2313.7801908818637;2316.085146367184;2340.3797993531643;2291;2302.7121609798774;2320.872352020638;2329.5224478981854;2330.4406942333885;2302.412884714387;2305.13557415969;2310.2838120182796;2314.849534780234;2320.9767902320928;8007.759767206993;8038.155993620644;8044.1955804419085;8067.273945344947;8091.109977902426;4770.666053376265;4900.877478063041;4914.778834952435;4920.089783390084;4939.234418665113;3088.7220150186367;3094.520349345855;3176.682331766828;3198.616166060064;3225.532297816827;946.6970569417789;986.8026394721085;987.0918754745651;997.9850302245472;1001.9398836069786;10853.24027318088;10857.077148442391;10874;10892.836607450894;10911.508982095826;4379.846705365297;4414.779261036935;4477.485089214782;4498.100379924028;4547.658925580595;9391.953040234755;9459.52702364879;9468.100530449596;9468.763280918032;9505.477198754135;4930.975345123323;4950.158473059589;4965.428975667773;4983;4995.950040499549;4369.978150109229;4445.777711114496;4496.280595104768;4505.864824055284;4518.502964673883;3529.4882242074755;3541.752077354612;3558.5373901392654;3593.9820300898327;3611.819409029538;967.0039858945297;975.8585005174352;979.4515071559949;981.9950900245453;1076.4348716923678;1259.8929091027364;1284.05621867927;1292.1665525735848;1296.598054603076;1297.3448408553809;7328.157261914841;7352.5220860643885;7372.889406658905;7521.5111017783665;7525.36034437079;1118.9216754827246;1123.8145705958425;1145.1411441418936;1152.4871432212585;1156.7166044319197;5816.476517113396;5861.091530812646;5899.351071382231;5903.085021821625;5945.524358051345;9234.81530369389;9468.005859384803;9575.569099390545;9579.425234485952;9595.760105997406;9474.715758527254;9551.283653726;9623.037696230462;9671;9684.46735429544;7528;7529.4941011797855;7581;7622.504537205064;7627.313541781266;7076.752313668997;7218.675159617935;7256.673449694882;7267.382272506896;7273.199948005821;8156.755297341089;8214.958925205336;8361.038480574569;8437.95781021091;8449.45078569891;8271.131531189138;8413.368997325102;8441.66233350659;8460.830783384175;8613;6430.164078669743;6603.141591593062;6627.3372662733345;6848.280930502425;7007.493388921406;7429.1456482503045;7487.925120748941;7497.400207983457;7548.735794247175;7555.659995300115;6704.631245281556;6797.592144471348;6845.110135682329;6926.238113807578;6976.5814051157095;6761.087253220752;6776.932230677828;6777.796666100025;6826.8634627308165;6857.314268573103;6981.197162326397;7104.715811367694;7147.392471639969;7160.140783106061;7215.819604509719;6472.805815825533;6532.314107018885;6565.737370505126;6620.66896655175;6629.038789375417;6621.702023408862;6681.832954176184;6722.563033402813;6730.8653826924165;6752.527323087534 02:07:40 INFO - PROCESS | 756 | |4;prototype.html;323.34199903197;324.8960332693538;332.0619250617008;332.36352385182386;332.8335832083958;6178.443940045395;6240.31356550779;6312.431881130698;6315.557910946236;6325.810225693225;6199.690015499218;6215;6222.906656400158;6226.40849119333;6232.376762323776;4451.866444006677;4572.634189264851;4668.6731928765;4685.4143232095985;4700.083483720676;4635.976820115895;4638.930416043762;4653.185692503798;4671.439427268732;4686.484486706459;4610.193216187171;4632.768361581924;4638.5361463853515;4646.163690535702;4651.604613607848;4627.444706635209;4638.443386793607;4640.257558790594;4649.535046495357;4685.4377474702915;4084.9795751021056;4091.1204091120253;4091.1408604193157;4091.3862920561855;4098.467199264106;5684.403137670526;5895.322037965603;5902.2622172228475;5904.17341572176;5941.168236446901;5310.44240354761;5350.518453339179;5380.381256155514;5391.299131112969;5395.082835917864;6553.246376666697;6566.179227596551;6567.9671601641685;6571.047198156289;6613.801585952429;4430.734155950621;4430.822767089313;4432.401625780511;4433.600975912151;4436.0462500562535;6801.897971530431;6809.693563789641;6835.14560679915;6862.245153033163;6866.690998905011;4415.867523974286;4520.344550040226;4522.072975040174;4528.252838281646;4539.341795439709;4562.634989200856;4586.380838586748;4594.058218065288;4599.448066232074;4600.516945720651;5369.060414427459;5371.140617501181;5372.946270537323;5379.300690910157;5384.192371144281;6578.8355291118105;6590.80227593173;6612.768553100618;6624.701888415033;6629.370209830058;1597.6565038516774;1600.9839901600835;1602.158866595047;1609.4125644139804;1612.5323656139822;1021.3616489693941;1053.7207639975413;1060.4008735064817;1066.6106870992032;1070.796548655753;6265.091561723524;6266.655333956676;6301.495880329563;6311.431971122621;6313;6704.932950670431;6746.156730408699;6748.730050798012;6771.966140169367;6811.591304521745;6183.443490085914;6413.8717225656155;6453.354664533509;6456.386643268882;6467.579607325509;3643.599204087548;3701.222743223899;3708.5364329458816;3710.962890371062;3716;7160.427165826722;7180.389666878374;7249.275072492708;7250.854982900418;7284.781456556312;7027.43780497559;7030.578165310098;7066.964665176744;7075.257098004636;7077.079979602619;7085.32689394517;7229.277072292729;7239.095113110861;7255.347018768336;7272.56364618114;6834.009068685113;6856.6228857413325;6856.794296171123;6857.348551887562;6862.794116176523;6801.625910574966;6805.251422343637;6805.557638753663;6809.21694005176;6811.591304521745;7197.100362454693;7212.783616491513;7212.855742885218;7249.492535522463;7262.854742905218;4390.626796722187;4511.70673906195;4548.545145485425;4556.567126123013;4557.7721113944835;6731.562448440835;6810.216825065181;6811.4550835934;6816.420604248694;6836.248012718696;6548.639824809681;6596.175478065242;6627.701753421204;6634.270230274569;6640.867182656223;6637.269900311058;6640.701168447335;6644.60132392058;6644.7009884554345;6648.700808463534;6315.842103947254;6426.710798014007;6482.416582507597;6484.967575162094;6510.414062734377;6621.834454138685;6628.304028076983;6629.03878937561;6645.302243264581;6648.301928297459;6418.839529011625;6466.418022378009;6466.838329041811;6482.416582507597;6502.60984340941 02:07:40 INFO - PROCESS | 756 | |5;yui.html;614.7510258345369;628.5455297064962;640.1006585747024;690.76168721791;699.1365663405696;12731.490740370386;12777.233365998047;12878.742425151515;12914.418851151686;12929.612111636654;13067.346632668352;13879.722405551884;14231.501897433593;14234.644133896658;14248.572542823731;820.8358328334342;826.0541679776652;830.1408042675831;830.4602008694367;849.0702680564772;831.4221615976899;836.6569706420369;843.4348986179275;845.3913182508614;846.7459762071385;867.635593050917;868.0885070675797;871.2115535440405;871.9258862996621;875.8160786234898;861.0356400831047;862.7368652561029;862.7454900804278;863.3956230638547;865.9826803463927;640.8686219325074;641.7400952614199;642.6818724731241;643.5237923936254;643.7811144210943;13871.098378605358;13973.441062357493;13982.091164074303;14055.016148869583;14073.718525629532;12371.319577423239;12568.560100396442;12795.48818047277;12907.483700651963;13103.017273704416;9699.612015519371;9897.978518644142;10008.549615267331;10105.747356316077;10113.24150688694;3480.686738193575;3510.824458777051;3533.452314891196;3562.7327950403565;3582.5342705448384;50006.499935000546;50553.74723126397;50652.74673626608;50731.49268507305;50874;9796.314258001872;10053;10133.543990520297;10185.592576297013;10241.129503992095;18346.908265458853;18349.541261468305;18372.632547348978;18379.08104594765;18437.815621843878;7251.274872512812;7340.669669864869;7438.516496427823;7454.105507339154;7489.775306740807;4167.74993500391;4314.590113939171;4370.584794444522;4379.277419225792;4431.468223813163;3022.486177349856;3057.3426713256313;3067.877284908623;3070.9846450767604;3081.0448760884196;564.5540023381565;566.9943300567024;568.7867049856304;571.4171545024052;578.1905332534401;533.5518164741636;654.6759354119646;661.2131563439588;666.5600703535644;683.4088513435843;8734.86897696535;9234.584443700049;9250.398724082914;9278.95360523193;9322.25421966241;587.9382664820217;600.9008513595295;619.0126747837193;669.3239827773983;710.0804458226609;4037.8384864605673;4127.277726397869;4139.3180726114415;4195.622393984495;4338.826446942087;54136;56979.715101425056;57346;57409.71295143497;57777;48480.7575962125;48872.5112748875;48877.75561122171;49157.508424916006;49870.25194622084;44737;45342;45715.31427028531;46353.7682311593;46588.99999999932;8326.167383261625;8478.491290522588;8589.355798315026;8639.827203456021;8715.738527844174;32640.183995400304;33119;33413.49879751854;33415.33169336648;34857.47713784346;40787.59212407838;40841.38737918993;43308.78345608252;44430.55569444264;44807.551924480336;10549.525271362654;10661.680149595524;10734.248602598056;10774.653168353956;11088.168387370819;11661.416929153678;11742.17804753659;11872.643820685393;11881.702957426134;11929.522819087138;11012.17408694367;11300.660980170607;11578.247413918069;11612.419379030845;11632.127590430582;10200.693979180636;10616.469176540988;10740.892591074302;11011.669649910515;11382.430878456209;10929.890701092887;11082.667519974413;11430.371329576954;11522.423878806194;11609.419529023684;8812.779680508038;8832.51421171816;9040.593173307085;9102.271818254656;9188.954055229948;8400.87398689008;8482.533460659723;8814.51520166397;8984.281257499253;9604.807903841744 02:07:40 INFO - PROCESS | 756 | __end_tp_report 02:07:40 INFO - PROCESS | 756 | __start_cc_report 02:07:40 INFO - PROCESS | 756 | _x_x_mozilla_cycle_collect,333 02:07:40 INFO - PROCESS | 756 | __end_cc_report 02:07:40 INFO - PROCESS | 756 | __startTimestamp1457431660256__endTimestamp 02:07:40 INFO - PROCESS | 756 | 02:07:40 INFO - PROCESS | 756 | ------- Summary: start ------- 02:07:40 INFO - PROCESS | 756 | Number of tests: 6 02:07:40 INFO - PROCESS | 756 | 02:07:40 INFO - PROCESS | 756 | [#0] dojo.html Cycles:165 Average:5305.71 Median:5497.64 stddev:591.18 (10.8%) stddev-sans-first:569.90 02:07:40 INFO - PROCESS | 756 | Values: 3220.0 3250.4 3282.7 3297.6 3309.2 5171.1 5318.4 5361.3 5362.5 5372.1 5261.8 5287.3 5318.8 5411.2 5413.3 4847.8 4893.4 4909.1 4962.6 5040.1 4797.5 5032.3 5033.1 5051.4 5063.5 4761.8 4791.5 4834.9 4918.3 4931.3 4883.3 4887.9 4913.1 4914.1 4979.7 4802.7 4853.8 4880.0 4897.7 4957.9 5036.1 5085.5 5097.9 5123.6 5151.0 5711.5 5749.3 5765.5 5765.9 5770.0 5677.7 5767.2 5768.8 5771.5 5815.3 5390.8 5427.2 5456.8 5494.1 5504.0 5722.2 5727.3 5737.5 5738.1 5746.6 5452.0 5541.3 5542.6 5543.0 5638.6 5728.1 5728.3 5777.6 5778.4 5810.8 5586.1 5625.7 5698.4 5748.5 5756.8 5657.5 5658.9 5704.8 5710.4 5727.3 4299.6 4333.0 4358.5 4358.8 4367.8 3846.4 3847.7 3851.9 3862.8 3889.9 5286.6 5305.7 5320.8 5324.0 5344.0 5614.5 5759.9 5787.1 5801.4 5860.3 5310.0 5322.3 5327.4 5333.2 5351.0 4737.1 4742.5 4749.4 4764.0 4790.2 6010.2 6035.6 6037.6 6044.4 6104.5 5739.2 5750.7 5751.7 5759.4 5763.1 5820.4 5952.2 6016.5 6016.6 6030.5 5530.7 5559.4 5563.9 5570.4 5619.4 5722.9 5757.3 5762.8 5765.1 5784.4 5510.7 5517.1 5518.7 5588.6 5610.5 5497.6 5538.2 5550.9 5559.5 5599.1 5440.1 5517.1 5535.3 5546.4 5551.2 5455.5 5598.8 5625.5 5641.0 5666.3 5383.1 5413.2 5445.7 5454.8 5467.6 02:07:40 INFO - PROCESS | 756 | 02:07:40 INFO - PROCESS | 756 | [#1] ext.html Cycles:180 Average:47200.25 Median:37592.13 stddev:75753.68 (201.5%) stddev-sans-first:75885.08 02:07:40 INFO - PROCESS | 756 | Values: 511.4 523.5 528.2 535.6 572.2 38855.4 39252.6 39539.6 39568.6 39593.8 40368.6 41034.8 41140.0 41294.6 41296.0 8543.7 8727.4 8738.4 8744.1 8767.7 8566.4 8698.4 8706.3 8712.7 8724.1 8684.7 8797.3 8807.6 8811.2 8834.6 8599.9 8601.8 8654.1 8679.7 8692.9 8450.9 8646.5 8690.9 8711.4 8727.4 37150.8 37517.4 37528.0 37640.6 37652.8 3326.2 3329.4 3420.5 3434.6 3597.1 28583.9 30406.8 30711.7 31852.5 31939.2 3629.9 3660.4 3781.5 3796.8 3831.2 272433.0 273065.0 273989.0 274394.0 275479.0 60095.4 60573.4 60833.0 60845.4 60914.7 68054.3 68167.0 69124.7 69286.0 69450.0 16215.5 16292.3 16392.4 16394.6 16413.8 12322.8 12399.3 12406.4 12406.9 12409.7 20535.3 21117.5 21434.6 21472.6 21502.7 8018.2 8272.8 8285.6 8383.8 8487.2 885.8 1027.8 1040.5 1060.6 1149.5 29317.3 29484.1 29922.3 30246.0 30272.5 1052.8 1062.6 1075.2 1115.8 1167.2 15197.0 15579.7 15615.2 15768.8 15874.5 306948.0 308021.0 309922.0 310634.0 313620.0 54008.5 54508.0 54793.7 54931.7 55230.7 1295.5 1309.5 1343.9 1350.8 1354.5 28160.0 29427.3 29595.4 29687.4 29732.3 49144.5 49410.8 49503.8 49648.0 49721.8 280904.0 285578.0 287476.0 289181.0 289213.0 33357.8 33669.8 33732.8 33785.8 33788.7 46108.0 46209.0 46723.8 46838.8 47469.0 37555.3 38504.0 39359.2 39481.4 39521.4 38073.0 38131.4 38976.2 39020.2 39429.6 37352.3 37629.0 38262.8 38437.0 38523.2 32605.0 34501.0 34575.5 34968.0 35081.8 27734.6 29014.0 29045.1 29125.9 29289.6 02:07:40 INFO - PROCESS | 756 | 02:07:40 INFO - PROCESS | 756 | [#2] jquery.html Cycles:180 Average:26330.18 Median:2304.72 stddev:76067.35 (3300.5%) stddev-sans-first:76255.73 02:07:40 INFO - PROCESS | 756 | Values: 349.5 349.7 353.3 354.2 356.4 16796.0 16945.5 16982.2 17262.1 17321.2 16145.0 16545.4 16559.1 16740.4 16908.3 5229.5 5233.2 5409.5 5428.2 5461.6 5320.3 5381.1 5398.7 5411.9 5443.3 5154.9 5316.4 5338.4 5377.3 5420.2 5295.0 5301.7 5322.3 5344.3 5363.1 4706.7 4719.8 4722.8 4723.0 4723.1 20365.3 20466.9 21059.6 21089.1 21168.3 2176.8 2192.9 2204.5 2234.8 2374.6 13079.8 13498.7 13534.9 13540.6 13806.3 1904.0 1916.2 1997.6 2033.6 2067.1 63219.7 67438.3 67952.0 68080.3 68242.0 10308.8 10458.3 10589.9 10643.5 10766.6 13869.3 13876.1 13896.8 13948.5 13981.0 7666.8 7707.5 7710.8 7839.1 7863.2 7466.7 7519.0 7562.2 7590.5 7601.7 4432.2 4612.5 4621.2 4640.6 4713.7 1824.7 1847.5 1875.6 1891.4 1905.8 879.3 895.8 909.9 947.6 966.7 15649.0 16254.3 16769.6 17297.7 17414.3 899.4 946.6 968.5 981.9 988.9 9706.3 9816.0 9874.7 9947.5 10094.1 438220.0 466093.0 467734.0 471353.0 480698.0 71010.3 71010.6 72515.3 72892.3 73008.6 988.2 1003.3 1028.8 1033.7 1040.3 14559.8 14966.4 15038.8 15074.2 15359.3 30698.4 31228.5 31747.2 31824.7 31834.0 40783.4 42186.0 43999.8 44211.0 44574.8 8180.3 8288.6 8325.8 10557.5 10971.7 12875.0 12961.7 12976.3 13164.3 13266.4 10903.0 11252.0 11309.3 11336.1 11414.4 11517.7 11661.3 11683.6 11918.1 11925.6 11211.5 11643.7 11660.4 11856.9 11895.4 11130.4 11230.3 11347.1 11420.7 11511.0 11686.1 11694.4 11731.8 11749.2 11861.1 02:07:40 INFO - PROCESS | 756 | 02:07:40 INFO - PROCESS | 756 | [#3] mootools.html Cycles:180 Average:5528.79 Median:6655.44 stddev:2846.48 (42.8%) stddev-sans-first:2838.42 02:07:40 INFO - PROCESS | 756 | Values: 1508.1 1524.9 1673.8 1793.7 1836.2 6897.6 7506.0 7709.8 7891.8 7893.2 7590.5 7678.3 7736.5 7752.8 7771.1 2308.7 2326.8 2336.5 2336.6 2338.6 2267.8 2277.1 2334.0 2339.1 2344.2 2294.4 2301.6 2313.8 2316.1 2340.4 2291.0 2302.7 2320.9 2329.5 2330.4 2302.4 2305.1 2310.3 2314.8 2321.0 8007.8 8038.2 8044.2 8067.3 8091.1 4770.7 4900.9 4914.8 4920.1 4939.2 3088.7 3094.5 3176.7 3198.6 3225.5 946.7 986.8 987.1 998.0 1001.9 10853.2 10857.1 10874.0 10892.8 10911.5 4379.8 4414.8 4477.5 4498.1 4547.7 9392.0 9459.5 9468.1 9468.8 9505.5 4931.0 4950.2 4965.4 4983.0 4996.0 4370.0 4445.8 4496.3 4505.9 4518.5 3529.5 3541.8 3558.5 3594.0 3611.8 967.0 975.9 979.5 982.0 1076.4 1259.9 1284.1 1292.2 1296.6 1297.3 7328.2 7352.5 7372.9 7521.5 7525.4 1118.9 1123.8 1145.1 1152.5 1156.7 5816.5 5861.1 5899.4 5903.1 5945.5 9234.8 9468.0 9575.6 9579.4 9595.8 9474.7 9551.3 9623.0 9671.0 9684.5 7528.0 7529.5 7581.0 7622.5 7627.3 7076.8 7218.7 7256.7 7267.4 7273.2 8156.8 8215.0 8361.0 8438.0 8449.5 8271.1 8413.4 8441.7 8460.8 8613.0 6430.2 6603.1 6627.3 6848.3 7007.5 7429.1 7487.9 7497.4 7548.7 7555.7 6704.6 6797.6 6845.1 6926.2 6976.6 6761.1 6776.9 6777.8 6826.9 6857.3 6981.2 7104.7 7147.4 7160.1 7215.8 6472.8 6532.3 6565.7 6620.7 6629.0 6621.7 6681.8 6722.6 6730.9 6752.5 02:07:40 INFO - PROCESS | 756 | 02:07:40 INFO - PROCESS | 756 | [#4] prototype.html Cycles:180 Average:5497.68 Median:6306.46 stddev:1708.79 (27.1%) stddev-sans-first:1668.86 02:07:40 INFO - PROCESS | 756 | Values: 323.3 324.9 332.1 332.4 332.8 6178.4 6240.3 6312.4 6315.6 6325.8 6199.7 6215.0 6222.9 6226.4 6232.4 4451.9 4572.6 4668.7 4685.4 4700.1 4636.0 4638.9 4653.2 4671.4 4686.5 4610.2 4632.8 4638.5 4646.2 4651.6 4627.4 4638.4 4640.3 4649.5 4685.4 4085.0 4091.1 4091.1 4091.4 4098.5 5684.4 5895.3 5902.3 5904.2 5941.2 5310.4 5350.5 5380.4 5391.3 5395.1 6553.2 6566.2 6568.0 6571.0 6613.8 4430.7 4430.8 4432.4 4433.6 4436.0 6801.9 6809.7 6835.1 6862.2 6866.7 4415.9 4520.3 4522.1 4528.3 4539.3 4562.6 4586.4 4594.1 4599.4 4600.5 5369.1 5371.1 5372.9 5379.3 5384.2 6578.8 6590.8 6612.8 6624.7 6629.4 1597.7 1601.0 1602.2 1609.4 1612.5 1021.4 1053.7 1060.4 1066.6 1070.8 6265.1 6266.7 6301.5 6311.4 6313.0 6704.9 6746.2 6748.7 6772.0 6811.6 6183.4 6413.9 6453.4 6456.4 6467.6 3643.6 3701.2 3708.5 3711.0 3716.0 7160.4 7180.4 7249.3 7250.9 7284.8 7027.4 7030.6 7067.0 7075.3 7077.1 7085.3 7229.3 7239.1 7255.3 7272.6 6834.0 6856.6 6856.8 6857.3 6862.8 6801.6 6805.3 6805.6 6809.2 6811.6 7197.1 7212.8 7212.9 7249.5 7262.9 4390.6 4511.7 4548.5 4556.6 4557.8 6731.6 6810.2 6811.5 6816.4 6836.2 6548.6 6596.2 6627.7 6634.3 6640.9 6637.3 6640.7 6644.6 6644.7 6648.7 6315.8 6426.7 6482.4 6485.0 6510.4 6621.8 6628.3 6629.0 6645.3 6648.3 6418.8 6466.4 6466.8 6482.4 6502.6 02:07:40 INFO - PROCESS | 756 | 02:07:40 INFO - PROCESS | 756 | [#5] yui.html Cycles:180 Average:13641.07 Median:46471.38 stddev:15730.79 (33.9%) stddev-sans-first:15744.50 02:07:40 INFO - PROCESS | 756 | Values: 614.8 628.5 640.1 690.8 699.1 12731.5 12777.2 12878.7 12914.4 12929.6 13067.3 13879.7 14231.5 14234.6 14248.6 820.8 826.1 830.1 830.5 849.1 831.4 836.7 843.4 845.4 846.7 867.6 868.1 871.2 871.9 875.8 861.0 862.7 862.7 863.4 866.0 640.9 641.7 642.7 643.5 643.8 13871.1 13973.4 13982.1 14055.0 14073.7 12371.3 12568.6 12795.5 12907.5 13103.0 9699.6 9898.0 10008.5 10105.7 10113.2 3480.7 3510.8 3533.5 3562.7 3582.5 50006.5 50553.7 50652.7 50731.5 50874.0 9796.3 10053.0 10133.5 10185.6 10241.1 18346.9 18349.5 18372.6 18379.1 18437.8 7251.3 7340.7 7438.5 7454.1 7489.8 4167.7 4314.6 4370.6 4379.3 4431.5 3022.5 3057.3 3067.9 3071.0 3081.0 564.6 567.0 568.8 571.4 578.2 533.6 654.7 661.2 666.6 683.4 8734.9 9234.6 9250.4 9279.0 9322.3 587.9 600.9 619.0 669.3 710.1 4037.8 4127.3 4139.3 4195.6 4338.8 54136.0 56979.7 57346.0 57409.7 57777.0 48480.8 48872.5 48877.8 49157.5 49870.3 44737.0 45342.0 45715.3 46353.8 46589.0 8326.2 8478.5 8589.4 8639.8 8715.7 32640.2 33119.0 33413.5 33415.3 34857.5 40787.6 40841.4 43308.8 44430.6 44807.6 10549.5 10661.7 10734.2 10774.7 11088.2 11661.4 11742.2 11872.6 11881.7 11929.5 11012.2 11300.7 11578.2 11612.4 11632.1 10200.7 10616.5 10740.9 11011.7 11382.4 10929.9 11082.7 11430.4 11522.4 11609.4 8812.8 8832.5 9040.6 9102.3 9189.0 8400.9 8482.5 8814.5 8984.3 9604.8 02:07:40 INFO - PROCESS | 756 | -------- Summary: end -------- 02:07:40 INFO - PROCESS | 756 | 02:07:41 INFO - TEST-INFO | 756: exit 0 02:07:41 INFO - TEST-OK | dromaeo_css | took 1112697ms 02:07:41 INFO - TEST-START | kraken 02:07:41 INFO - operating with platform_type : linux_ 02:07:41 INFO - Initialising browser for kraken test... 02:07:41 INFO - TEST-INFO | started process 1003 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpdNBZT5/profile http://localhost:50693/getInfo.html) 02:07:45 INFO - PROCESS | 1003 | 02:07:45 INFO - PROCESS | 1003 | (process:1079): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 02:07:46 INFO - PROCESS | 1003 | __metrics Screen width/height:1600/1200 02:07:46 INFO - PROCESS | 1003 | colorDepth:24 02:07:46 INFO - PROCESS | 1003 | Browser inner width/height: 1024/697 02:07:46 INFO - PROCESS | 1003 | __metrics 02:07:47 ERROR - PROCESS | 1003 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 2849: TypeError: this.tabs is undefined 02:07:48 INFO - TEST-INFO | 1003: exit 0 02:07:48 INFO - Browser initialized. 02:07:48 INFO - Running cycle 1/1 for kraken test... 02:07:48 INFO - TEST-INFO | started process 1138 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpdNBZT5/profile -tp file:/builds/slave/test-pgo/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 02:07:49 INFO - PROCESS | 1138 | 02:07:49 INFO - PROCESS | 1138 | (process:1254): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 02:08:00 INFO - PROCESS | 1138 | RSS: Main: 161230848 02:08:00 INFO - PROCESS | 1138 | 02:08:02 INFO - PROCESS | 1138 | Cycle 1(1): loaded http://localhost:50693/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:50693/tests/kraken/driver.html?testName=audio-beat-detection) 02:08:03 INFO - PROCESS | 1138 | RSS: Main: 167579648 02:08:03 INFO - PROCESS | 1138 | 02:08:06 INFO - PROCESS | 1138 | Cycle 1(1): loaded http://localhost:50693/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:50693/tests/kraken/driver.html?testName=audio-dft) 02:08:06 INFO - PROCESS | 1138 | RSS: Main: 171728896 02:08:06 INFO - PROCESS | 1138 | 02:08:09 INFO - PROCESS | 1138 | Cycle 1(1): loaded http://localhost:50693/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:50693/tests/kraken/driver.html?testName=audio-fft) 02:08:10 INFO - PROCESS | 1138 | RSS: Main: 164638720 02:08:10 INFO - PROCESS | 1138 | 02:08:12 INFO - PROCESS | 1138 | Cycle 1(1): loaded http://localhost:50693/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:50693/tests/kraken/driver.html?testName=audio-oscillator) 02:08:12 INFO - PROCESS | 1138 | RSS: Main: 166129664 02:08:12 INFO - PROCESS | 1138 | 02:08:14 INFO - PROCESS | 1138 | Cycle 1(1): loaded http://localhost:50693/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:50693/tests/kraken/driver.html?testName=imaging-gaussian-blur) 02:08:15 INFO - PROCESS | 1138 | RSS: Main: 165634048 02:08:15 INFO - PROCESS | 1138 | 02:08:18 INFO - PROCESS | 1138 | Cycle 1(1): loaded http://localhost:50693/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:50693/tests/kraken/driver.html?testName=imaging-darkroom) 02:08:19 INFO - PROCESS | 1138 | RSS: Main: 166027264 02:08:19 INFO - PROCESS | 1138 | 02:08:22 INFO - PROCESS | 1138 | Cycle 1(1): loaded http://localhost:50693/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:50693/tests/kraken/driver.html?testName=imaging-desaturate) 02:08:23 INFO - PROCESS | 1138 | RSS: Main: 166309888 02:08:23 INFO - PROCESS | 1138 | 02:08:25 INFO - PROCESS | 1138 | Cycle 1(1): loaded http://localhost:50693/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:50693/tests/kraken/driver.html?testName=json-parse-financial) 02:08:26 INFO - PROCESS | 1138 | RSS: Main: 164933632 02:08:26 INFO - PROCESS | 1138 | 02:08:28 INFO - PROCESS | 1138 | Cycle 1(1): loaded http://localhost:50693/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:50693/tests/kraken/driver.html?testName=json-stringify-tinderbox) 02:08:28 INFO - PROCESS | 1138 | RSS: Main: 166907904 02:08:28 INFO - PROCESS | 1138 | 02:08:30 INFO - PROCESS | 1138 | Cycle 1(1): loaded http://localhost:50693/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:50693/tests/kraken/driver.html?testName=stanford-crypto-aes) 02:08:31 INFO - PROCESS | 1138 | RSS: Main: 166092800 02:08:31 INFO - PROCESS | 1138 | 02:08:33 INFO - PROCESS | 1138 | Cycle 1(1): loaded http://localhost:50693/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:50693/tests/kraken/driver.html?testName=stanford-crypto-ccm) 02:08:33 INFO - PROCESS | 1138 | RSS: Main: 167006208 02:08:33 INFO - PROCESS | 1138 | 02:08:36 INFO - PROCESS | 1138 | Cycle 1(1): loaded http://localhost:50693/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:50693/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 02:08:36 INFO - PROCESS | 1138 | RSS: Main: 166748160 02:08:36 INFO - PROCESS | 1138 | 02:08:39 INFO - PROCESS | 1138 | Cycle 1(1): loaded http://localhost:50693/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:50693/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 02:08:40 INFO - PROCESS | 1138 | RSS: Main: 166006784 02:08:40 INFO - PROCESS | 1138 | 02:08:41 INFO - PROCESS | 1138 | Cycle 1(1): loaded http://localhost:50693/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:50693/tests/kraken/driver.html?testName=ai-astar) 02:08:42 INFO - PROCESS | 1138 | RSS: Main: 167383040 02:08:42 INFO - PROCESS | 1138 | 02:08:42 INFO - PROCESS | 1138 | __start_tp_report 02:08:42 INFO - PROCESS | 1138 | _x_x_mozilla_page_load 02:08:42 INFO - PROCESS | 1138 | _x_x_mozilla_page_load_details 02:08:42 INFO - PROCESS | 1138 | |i|pagename|runs| 02:08:42 INFO - PROCESS | 1138 | |0;ai-astar;112;106;111;111;112;124;112;113;112;112 02:08:42 INFO - PROCESS | 1138 | |1;audio-beat-detection;150;125;161;168;146;162;150;130;164;128 02:08:42 INFO - PROCESS | 1138 | |2;audio-dft;164;161;162;164;162;163;161;167;166;162 02:08:42 INFO - PROCESS | 1138 | |3;audio-fft;72;74;73;75;73;152;75;75;74;77 02:08:42 INFO - PROCESS | 1138 | |4;audio-oscillator;93;93;148;93;93;93;140;93;95;138 02:08:42 INFO - PROCESS | 1138 | |5;imaging-gaussian-blur;118;118;118;120;117;117;118;117;118;117 02:08:42 INFO - PROCESS | 1138 | |6;imaging-darkroom;153;147;146;146;146;146;147;146;146;146 02:08:42 INFO - PROCESS | 1138 | |7;imaging-desaturate;96;96;96;96;97;97;96;95;96;99 02:08:42 INFO - PROCESS | 1138 | |8;json-parse-financial;58;58;61;65;59;58;60;69;56;55 02:08:42 INFO - PROCESS | 1138 | |9;json-stringify-tinderbox;67;68;66;67;67;70;67;68;67;67 02:08:42 INFO - PROCESS | 1138 | |10;stanford-crypto-aes;82;91;90;83;85;83;85;83;83;91 02:08:42 INFO - PROCESS | 1138 | |11;stanford-crypto-ccm;124;116;121;118;128;122;124;121;123;119 02:08:42 INFO - PROCESS | 1138 | |12;stanford-crypto-pbkdf2;141;152;155;150;155;152;153;148;143;140 02:08:42 INFO - PROCESS | 1138 | |13;stanford-crypto-sha256-iterative;76;68;71;76;72;69;68;68;72;68 02:08:42 INFO - PROCESS | 1138 | __end_tp_report 02:08:42 INFO - PROCESS | 1138 | __start_cc_report 02:08:42 INFO - PROCESS | 1138 | _x_x_mozilla_cycle_collect,832 02:08:42 INFO - PROCESS | 1138 | __end_cc_report 02:08:42 INFO - PROCESS | 1138 | __startTimestamp1457431722015__endTimestamp 02:08:42 INFO - PROCESS | 1138 | 02:08:42 INFO - PROCESS | 1138 | ------- Summary: start ------- 02:08:42 INFO - PROCESS | 1138 | Number of tests: 14 02:08:42 INFO - PROCESS | 1138 | 02:08:42 INFO - PROCESS | 1138 | [#0] ai-astar Cycles:10 Average:112.50 Median:112.00 stddev:4.48 (4.0%) stddev-sans-first:4.75 02:08:42 INFO - PROCESS | 1138 | Values: 112.0 106.0 111.0 111.0 112.0 124.0 112.0 113.0 112.0 112.0 02:08:42 INFO - PROCESS | 1138 | 02:08:42 INFO - PROCESS | 1138 | [#1] audio-beat-detection Cycles:10 Average:148.40 Median:155.50 stddev:15.93 (10.2%) stddev-sans-first:16.89 02:08:42 INFO - PROCESS | 1138 | Values: 150.0 125.0 161.0 168.0 146.0 162.0 150.0 130.0 164.0 128.0 02:08:42 INFO - PROCESS | 1138 | 02:08:42 INFO - PROCESS | 1138 | [#2] audio-dft Cycles:10 Average:163.20 Median:163.50 stddev:2.04 (1.3%) stddev-sans-first:2.15 02:08:42 INFO - PROCESS | 1138 | Values: 164.0 161.0 162.0 164.0 162.0 163.0 161.0 167.0 166.0 162.0 02:08:42 INFO - PROCESS | 1138 | 02:08:42 INFO - PROCESS | 1138 | [#3] audio-fft Cycles:10 Average:82.00 Median:74.50 stddev:24.64 (33.1%) stddev-sans-first:25.86 02:08:42 INFO - PROCESS | 1138 | Values: 72.0 74.0 73.0 75.0 73.0 152.0 75.0 75.0 74.0 77.0 02:08:42 INFO - PROCESS | 1138 | 02:08:42 INFO - PROCESS | 1138 | [#4] audio-oscillator Cycles:10 Average:107.90 Median:93.00 stddev:23.67 (25.5%) stddev-sans-first:24.49 02:08:42 INFO - PROCESS | 1138 | Values: 93.0 93.0 148.0 93.0 93.0 93.0 140.0 93.0 95.0 138.0 02:08:42 INFO - PROCESS | 1138 | 02:08:42 INFO - PROCESS | 1138 | [#5] imaging-gaussian-blur Cycles:10 Average:117.80 Median:118.00 stddev:0.92 (0.8%) stddev-sans-first:0.97 02:08:42 INFO - PROCESS | 1138 | Values: 118.0 118.0 118.0 120.0 117.0 117.0 118.0 117.0 118.0 117.0 02:08:42 INFO - PROCESS | 1138 | 02:08:42 INFO - PROCESS | 1138 | [#6] imaging-darkroom Cycles:10 Average:146.90 Median:146.00 stddev:2.18 (1.5%) stddev-sans-first:0.44 02:08:42 INFO - PROCESS | 1138 | Values: 153.0 147.0 146.0 146.0 146.0 146.0 147.0 146.0 146.0 146.0 02:08:42 INFO - PROCESS | 1138 | 02:08:42 INFO - PROCESS | 1138 | [#7] imaging-desaturate Cycles:10 Average:96.40 Median:96.00 stddev:1.07 (1.1%) stddev-sans-first:1.13 02:08:42 INFO - PROCESS | 1138 | Values: 96.0 96.0 96.0 96.0 97.0 97.0 96.0 95.0 96.0 99.0 02:08:42 INFO - PROCESS | 1138 | 02:08:42 INFO - PROCESS | 1138 | [#8] json-parse-financial Cycles:10 Average:59.90 Median:59.50 stddev:4.23 (7.1%) stddev-sans-first:4.43 02:08:42 INFO - PROCESS | 1138 | Values: 58.0 58.0 61.0 65.0 59.0 58.0 60.0 69.0 56.0 55.0 02:08:42 INFO - PROCESS | 1138 | 02:08:42 INFO - PROCESS | 1138 | [#9] json-stringify-tinderbox Cycles:10 Average:67.40 Median:67.00 stddev:1.07 (1.6%) stddev-sans-first:1.13 02:08:42 INFO - PROCESS | 1138 | Values: 67.0 68.0 66.0 67.0 67.0 70.0 67.0 68.0 67.0 67.0 02:08:42 INFO - PROCESS | 1138 | 02:08:42 INFO - PROCESS | 1138 | [#10] stanford-crypto-aes Cycles:10 Average:85.60 Median:85.00 stddev:3.63 (4.3%) stddev-sans-first:3.61 02:08:42 INFO - PROCESS | 1138 | Values: 82.0 91.0 90.0 83.0 85.0 83.0 85.0 83.0 83.0 91.0 02:08:42 INFO - PROCESS | 1138 | 02:08:42 INFO - PROCESS | 1138 | [#11] stanford-crypto-ccm Cycles:10 Average:121.60 Median:122.50 stddev:3.44 (2.8%) stddev-sans-first:3.54 02:08:42 INFO - PROCESS | 1138 | Values: 124.0 116.0 121.0 118.0 128.0 122.0 124.0 121.0 123.0 119.0 02:08:42 INFO - PROCESS | 1138 | 02:08:42 INFO - PROCESS | 1138 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:148.90 Median:152.00 stddev:5.67 (3.7%) stddev-sans-first:5.24 02:08:42 INFO - PROCESS | 1138 | Values: 141.0 152.0 155.0 150.0 155.0 152.0 153.0 148.0 143.0 140.0 02:08:42 INFO - PROCESS | 1138 | 02:08:42 INFO - PROCESS | 1138 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:70.80 Median:71.50 stddev:3.19 (4.5%) stddev-sans-first:2.77 02:08:42 INFO - PROCESS | 1138 | Values: 76.0 68.0 71.0 76.0 72.0 69.0 68.0 68.0 72.0 68.0 02:08:42 INFO - PROCESS | 1138 | -------- Summary: end -------- 02:08:42 INFO - PROCESS | 1138 | 02:08:42 INFO - TEST-INFO | 1138: exit 0 02:08:42 INFO - TEST-OK | kraken | took 61884ms 02:08:42 INFO - SUITE-END | took 1174s 02:08:43 INFO - Completed test suite (00:19:34) 02:08:43 INFO - javascript benchmark 02:08:43 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"lowerIsBetter": false, "subtests": [{"lowerIsBetter": false, "replicates": [3219.983900080499, 3250.398676244895, 3282.7209687176587, 3297.5713157289556, 3309.2388750587365, 5171.0692075426405, 5318.3617965844105, 5361.329833770778, 5362.490563396476, 5372.059889519328, 5261.76322065507, 5287.312649355588, 5318.840434786953, 5411.188321751739, 5413.26920865683, 4847.757612119389, 4893.363862697862, 4909.0672772173175, 4962.578180854632, 5040.1179793535985, 4797.544233297831, 5032.345795046657, 5033.068882256776, 5051.419086805009, 5063.544281014708, 4761.833335833264, 4791.520847915215, 4834.879128021792, 4918.311436398907, 4931.2603109533675, 4883.316335713003, 4887.853364399074, 4913.115639184945, 4914.14002549556, 4979.651424400294, 4802.687825291345, 4853.757312134415, 4879.951200487985, 4897.730624815634, 4957.925631115536, 5036.093503169428, 5085.466026067246, 5097.929434818692, 5123.641345105844, 5151.021305951857, 5711.485966263015, 5749.3388260350175, 5765.452282033242, 5765.884682306372, 5769.9711501442225, 5677.659340439587, 5767.221425107598, 5768.769249230026, 5771.451712087345, 5815.331236907768, 5390.811321603725, 5427.158790387417, 5456.83629491112, 5494.148406996922, 5503.972480137573, 5722.198892155102, 5727.31272247333, 5737.512311453574, 5738.110592858114, 5746.569007324468, 5452.0, 5541.2796336476, 5542.63972841764, 5542.972285138549, 5638.605297629127, 5728.054870946247, 5728.312602487728, 5777.595568310178, 5778.393268706809, 5810.767569297265, 5586.078297080936, 5625.71871406428, 5698.373178950312, 5748.540116790647, 5756.798512052058, 5657.4908258256955, 5658.858528536737, 5704.828855134353, 5710.371859095496, 5727.341355744059, 4299.634531064832, 4332.956670433318, 4358.4769827620885, 4358.825646974085, 4367.825286988548, 3846.3845784674318, 3847.711421643388, 3851.9422208666892, 3862.7682339059747, 3889.8833035008997, 5286.603504737083, 5305.681659100466, 5320.787168513216, 5324.041672498987, 5344.0, 5614.466625670555, 5759.913601295984, 5787.074068149076, 5801.361850196475, 5860.2967643883, 5309.973450132725, 5322.28149199853, 5327.413984461706, 5333.173358129496, 5350.9732451337495, 4737.052589482118, 4742.549457801503, 4749.35883655702, 4764.0471905619015, 4790.233562629963, 6010.188624535632, 6035.637861728223, 6037.577369584087, 6044.425779550936, 6104.481119104837, 5739.167820665896, 5750.6837123958585, 5751.683657398883, 5759.424057594207, 5763.106718458645, 5820.388859169896, 5952.196453478725, 6016.458518733335, 6016.639001659914, 6030.517558595389, 5530.723463826712, 5559.416261292506, 5563.860903477445, 5570.415106413769, 5619.438056194348, 5722.8569285766525, 5757.251557297692, 5762.798302059407, 5765.077587585966, 5784.392638772868, 5510.696911669736, 5517.062099443185, 5518.724063796874, 5588.552915766648, 5610.5231055360755, 5497.642653227527, 5538.224648549126, 5550.861228469321, 5559.499645031805, 5599.076152434803, 5440.075187218262, 5517.062099443024, 5535.252740880091, 5546.4453554644215, 5551.167324901297, 5455.454454554513, 5598.804041858515, 5625.46558076982, 5640.971795140998, 5666.320041595035, 5383.0579648562125, 5413.188021796762, 5445.673259604437, 5454.754536045967, 5467.644603100785], "unit": "score", "name": "dojo.html", "value": 5267.642233761769}, {"lowerIsBetter": false, "replicates": [511.442527644867, 523.4765234765234, 528.1575886461096, 535.5661913849782, 572.2046355565761, 38855.41716874249, 39252.60747392525, 39539.61611343604, 39568.60431395685, 39593.80203098988, 40368.59631403685, 41034.79482602583, 41140.0, 41294.58705412945, 41296.0, 8543.658253669846, 8727.432716873414, 8738.432001919886, 8744.081871403507, 8767.693130740425, 8566.400351975364, 8698.39111262212, 8706.347023973196, 8712.651493940235, 8724.08397118303, 8684.652613895469, 8797.29621630268, 8807.64769409223, 8811.206991370775, 8834.646614135427, 8599.914000860004, 8601.827963440759, 8654.09132041133, 8679.696210632661, 8692.869606955901, 8450.87323690145, 8646.48121112729, 8690.913090869073, 8711.433756805787, 8727.432716873447, 37150.814245928865, 37517.437238441446, 37528.0, 37640.62359376399, 37652.81173594115, 3326.185084654251, 3329.417351963397, 3420.538227339327, 3434.5706786651667, 3597.0647631615966, 28583.857080714464, 30406.84796576025, 30711.69288307133, 31852.522212166838, 31939.201519961953, 3629.891103266906, 3660.359437098497, 3781.4894989176382, 3796.791176485292, 3831.1571454280015, 272433.0, 273065.0, 273989.0, 274394.0, 275479.0, 60095.39904600986, 60573.39426605678, 60833.0, 60845.39154608486, 60914.69542652259, 68054.3194568058, 68167.0, 69124.65437672779, 69286.0, 69450.0, 16215.513534593982, 16292.34830606786, 16392.426265080663, 16394.590135246715, 16413.753793693104, 12322.81515777264, 12399.318037507843, 12406.441710122886, 12406.875931240573, 12409.689757756129, 20535.28126515565, 21117.472063198544, 21434.57130857374, 21472.57054858894, 21502.677459838116, 8018.2359880826125, 8272.83454330922, 8285.62714677841, 8383.790405239917, 8487.151284871587, 885.8272636835884, 1027.8201314769885, 1040.458961340099, 1060.612876300145, 1149.4654985431648, 29317.26706832346, 29484.11547653574, 29922.251943701147, 30245.97540246002, 30272.54591181134, 1052.7947050325113, 1062.6387028410377, 1075.2365820267698, 1115.8437818705388, 1167.2062997161843, 15197.0, 15579.688406231811, 15615.219239038002, 15768.76346854798, 15874.52376428709, 306948.0, 308021.0, 309922.0, 310634.0, 313620.0, 54008.45991540113, 54508.0, 54793.72603137039, 54931.725341373036, 55230.72384638051, 1295.4688577683105, 1309.5285697149018, 1343.8521762606106, 1350.8378994520524, 1354.525915929417, 28160.0, 29427.264318392212, 29595.408091837613, 29687.406251875273, 29732.256693582833, 49144.50855491399, 49410.752946235036, 49503.75248123737, 49648.0, 49721.75139124281, 280904.0, 285578.0, 287476.0, 289181.0, 289213.0, 33357.831006055356, 33669.83165084159, 33732.83133584316, 33785.83107084449, 33788.66211337855, 46108.0, 46209.0, 46723.76638116788, 46838.76580617075, 47469.0, 37555.25619917091, 38504.0, 39359.2128157441, 39481.40777888276, 39521.407178892914, 38073.0, 38131.42802858015, 38976.2204755909, 39020.2195956085, 39429.605703943744, 37352.319145637965, 37629.0, 38262.80868595639, 38437.0, 38523.22953540969, 32605.003396874457, 34501.0, 34575.481367780005, 34967.95096147119, 35081.82459087688, 27734.5839812407, 29014.023047781604, 29045.12864614065, 29125.85437072801, 29289.560656590595], "unit": "score", "name": "ext.html", "value": 19024.174598225614}, {"lowerIsBetter": false, "replicates": [349.48451034723803, 349.662575614532, 353.28812442927506, 354.2348527181286, 356.36033320190273, 16796.0, 16945.491635250946, 16982.15089245539, 17262.136893155322, 17321.22054507547, 16145.0, 16545.42091026814, 16559.08925009127, 16740.41408550701, 16908.323667053304, 5229.529342359187, 5233.21501774733, 5409.486098820606, 5428.185772134172, 5461.617686761928, 5320.334958130234, 5381.058314794915, 5398.730063496829, 5411.918821217685, 5443.292371991635, 5154.92267615986, 5316.38861530925, 5338.386085600147, 5377.274068000809, 5420.186971954199, 5295.0, 5301.674581354661, 5322.281491998569, 5344.278522399484, 5363.115086010823, 4706.670533062687, 4719.764011799431, 4722.83470078549, 4722.952770472286, 4723.102610503994, 20365.287214947406, 20466.897665511726, 21059.5788084239, 21089.050992705364, 21168.259110931045, 2176.7823217678106, 2192.8903554822195, 2204.515006698524, 2234.8100411465043, 2374.6200607902824, 13079.803802942963, 13498.662533436644, 13534.932325338408, 13540.593782186452, 13806.309684515834, 1903.9524011899675, 1916.2335065973582, 1997.5838085342339, 2033.593281343737, 2067.059487933002, 63219.683901580654, 67438.32561674419, 67952.0, 68080.31919680838, 68242.0, 10308.793824123626, 10458.320209186379, 10589.894101058891, 10643.52104155315, 10766.56933722658, 13869.306534673226, 13876.098053626481, 13896.791548126786, 13948.511802086878, 13981.0, 7666.769996900102, 7707.4604777666145, 7710.7686769397005, 7839.09850367215, 7863.174366691529, 7466.70133194677, 7519.0, 7562.205968373351, 7590.506617069983, 7601.695932162762, 4432.180046691308, 4612.469565999953, 4621.23749581322, 4640.559146881041, 4713.740744259098, 1824.6806808808406, 1847.4919397165618, 1875.5711353796867, 1891.4367146003347, 1905.8380037696675, 879.3097418526426, 895.7805337692176, 909.9454032757923, 947.6351604632129, 966.6568368229318, 15649.0, 16254.268557914686, 16769.580760480843, 17297.740533892003, 17414.303427862997, 899.4108858697564, 946.5551190940247, 968.4867020479157, 981.8625392445064, 988.945607991553, 9706.320557561045, 9815.950920245496, 9874.703758887244, 9947.502624868872, 10094.141997930112, 438220.0, 466093.0, 467734.0, 471353.0, 480698.0, 71010.28989710141, 71010.64494677597, 72515.2748472519, 72892.27107728961, 73008.63495682487, 988.2094324540338, 1003.3227571389428, 1028.7685270814006, 1033.6847261585137, 1040.2770074798093, 14559.781603276171, 14966.40134394612, 15038.849611503745, 15074.246287685792, 15359.308831102404, 30698.386032278784, 31228.53157202689, 31747.206319841265, 31824.681753182173, 31834.0, 40783.388249175696, 42186.0, 43999.78000110107, 44211.0, 44574.77712611416, 8180.345572354078, 8288.58557072156, 8325.83348333042, 10557.52491137916, 10971.725706857393, 12875.0, 12961.675958101123, 12976.286304252979, 13164.275964822027, 13266.403011864682, 10903.0, 11252.0, 11309.264897781617, 11336.093112551142, 11414.372209528556, 11517.712057198638, 11661.300321980709, 11683.591074312699, 11918.093105103142, 11925.582604608797, 11211.495482703134, 11643.708907277385, 11660.41697915084, 11856.940715296369, 11895.405229738652, 11130.387828669502, 11230.270032447865, 11347.14896382791, 11420.657380278604, 11511.0, 11686.071798153209, 11694.356810375171, 11731.824022639497, 11749.177557570887, 11861.05111591088], "unit": "score", "name": "jquery.html", "value": 8674.304460361975}, {"lowerIsBetter": false, "replicates": [1508.1026789060506, 1524.8780097592194, 1673.790776152981, 1793.6950718377875, 1836.2104295153079, 6897.5861448313135, 7506.0, 7709.768706938787, 7891.842163156741, 7893.171217022216, 7590.468667193299, 7678.347340476066, 7736.458447908649, 7752.7674169774855, 7771.145174030852, 2308.722953245613, 2326.8254880883915, 2336.4626135988733, 2336.6495025746103, 2338.6141286687675, 2267.761885002076, 2277.0664027748626, 2333.9847166482637, 2339.0526836631107, 2344.249840051176, 2294.403455101669, 2301.551197516485, 2313.7801908818637, 2316.085146367184, 2340.3797993531643, 2291.0, 2302.7121609798774, 2320.872352020638, 2329.5224478981854, 2330.4406942333885, 2302.412884714387, 2305.13557415969, 2310.2838120182796, 2314.849534780234, 2320.9767902320928, 8007.759767206993, 8038.155993620644, 8044.1955804419085, 8067.273945344947, 8091.109977902426, 4770.666053376265, 4900.877478063041, 4914.778834952435, 4920.089783390084, 4939.234418665113, 3088.7220150186367, 3094.520349345855, 3176.682331766828, 3198.616166060064, 3225.532297816827, 946.6970569417789, 986.8026394721085, 987.0918754745651, 997.9850302245472, 1001.9398836069786, 10853.24027318088, 10857.077148442391, 10874.0, 10892.836607450894, 10911.508982095826, 4379.846705365297, 4414.779261036935, 4477.485089214782, 4498.100379924028, 4547.658925580595, 9391.953040234755, 9459.52702364879, 9468.100530449596, 9468.763280918032, 9505.477198754135, 4930.975345123323, 4950.158473059589, 4965.428975667773, 4983.0, 4995.950040499549, 4369.978150109229, 4445.777711114496, 4496.280595104768, 4505.864824055284, 4518.502964673883, 3529.4882242074755, 3541.752077354612, 3558.5373901392654, 3593.9820300898327, 3611.819409029538, 967.0039858945297, 975.8585005174352, 979.4515071559949, 981.9950900245453, 1076.4348716923678, 1259.8929091027364, 1284.05621867927, 1292.1665525735848, 1296.598054603076, 1297.3448408553809, 7328.157261914841, 7352.5220860643885, 7372.889406658905, 7521.5111017783665, 7525.36034437079, 1118.9216754827246, 1123.8145705958425, 1145.1411441418936, 1152.4871432212585, 1156.7166044319197, 5816.476517113396, 5861.091530812646, 5899.351071382231, 5903.085021821625, 5945.524358051345, 9234.81530369389, 9468.005859384803, 9575.569099390545, 9579.425234485952, 9595.760105997406, 9474.715758527254, 9551.283653726, 9623.037696230462, 9671.0, 9684.46735429544, 7528.0, 7529.4941011797855, 7581.0, 7622.504537205064, 7627.313541781266, 7076.752313668997, 7218.675159617935, 7256.673449694882, 7267.382272506896, 7273.199948005821, 8156.755297341089, 8214.958925205336, 8361.038480574569, 8437.95781021091, 8449.45078569891, 8271.131531189138, 8413.368997325102, 8441.66233350659, 8460.830783384175, 8613.0, 6430.164078669743, 6603.141591593062, 6627.3372662733345, 6848.280930502425, 7007.493388921406, 7429.1456482503045, 7487.925120748941, 7497.400207983457, 7548.735794247175, 7555.659995300115, 6704.631245281556, 6797.592144471348, 6845.110135682329, 6926.238113807578, 6976.5814051157095, 6761.087253220752, 6776.932230677828, 6777.796666100025, 6826.8634627308165, 6857.314268573103, 6981.197162326397, 7104.715811367694, 7147.392471639969, 7160.140783106061, 7215.819604509719, 6472.805815825533, 6532.314107018885, 6565.737370505126, 6620.66896655175, 6629.038789375417, 6621.702023408862, 6681.832954176184, 6722.563033402813, 6730.8653826924165, 6752.527323087534], "unit": "score", "name": "mootools.html", "value": 4546.247416793275}, {"lowerIsBetter": false, "replicates": [323.34199903197, 324.8960332693538, 332.0619250617008, 332.36352385182386, 332.8335832083958, 6178.443940045395, 6240.31356550779, 6312.431881130698, 6315.557910946236, 6325.810225693225, 6199.690015499218, 6215.0, 6222.906656400158, 6226.40849119333, 6232.376762323776, 4451.866444006677, 4572.634189264851, 4668.6731928765, 4685.4143232095985, 4700.083483720676, 4635.976820115895, 4638.930416043762, 4653.185692503798, 4671.439427268732, 4686.484486706459, 4610.193216187171, 4632.768361581924, 4638.5361463853515, 4646.163690535702, 4651.604613607848, 4627.444706635209, 4638.443386793607, 4640.257558790594, 4649.535046495357, 4685.4377474702915, 4084.9795751021056, 4091.1204091120253, 4091.1408604193157, 4091.3862920561855, 4098.467199264106, 5684.403137670526, 5895.322037965603, 5902.2622172228475, 5904.17341572176, 5941.168236446901, 5310.44240354761, 5350.518453339179, 5380.381256155514, 5391.299131112969, 5395.082835917864, 6553.246376666697, 6566.179227596551, 6567.9671601641685, 6571.047198156289, 6613.801585952429, 4430.734155950621, 4430.822767089313, 4432.401625780511, 4433.600975912151, 4436.0462500562535, 6801.897971530431, 6809.693563789641, 6835.14560679915, 6862.245153033163, 6866.690998905011, 4415.867523974286, 4520.344550040226, 4522.072975040174, 4528.252838281646, 4539.341795439709, 4562.634989200856, 4586.380838586748, 4594.058218065288, 4599.448066232074, 4600.516945720651, 5369.060414427459, 5371.140617501181, 5372.946270537323, 5379.300690910157, 5384.192371144281, 6578.8355291118105, 6590.80227593173, 6612.768553100618, 6624.701888415033, 6629.370209830058, 1597.6565038516774, 1600.9839901600835, 1602.158866595047, 1609.4125644139804, 1612.5323656139822, 1021.3616489693941, 1053.7207639975413, 1060.4008735064817, 1066.6106870992032, 1070.796548655753, 6265.091561723524, 6266.655333956676, 6301.495880329563, 6311.431971122621, 6313.0, 6704.932950670431, 6746.156730408699, 6748.730050798012, 6771.966140169367, 6811.591304521745, 6183.443490085914, 6413.8717225656155, 6453.354664533509, 6456.386643268882, 6467.579607325509, 3643.599204087548, 3701.222743223899, 3708.5364329458816, 3710.962890371062, 3716.0, 7160.427165826722, 7180.389666878374, 7249.275072492708, 7250.854982900418, 7284.781456556312, 7027.43780497559, 7030.578165310098, 7066.964665176744, 7075.257098004636, 7077.079979602619, 7085.32689394517, 7229.277072292729, 7239.095113110861, 7255.347018768336, 7272.56364618114, 6834.009068685113, 6856.6228857413325, 6856.794296171123, 6857.348551887562, 6862.794116176523, 6801.625910574966, 6805.251422343637, 6805.557638753663, 6809.21694005176, 6811.591304521745, 7197.100362454693, 7212.783616491513, 7212.855742885218, 7249.492535522463, 7262.854742905218, 4390.626796722187, 4511.70673906195, 4548.545145485425, 4556.567126123013, 4557.7721113944835, 6731.562448440835, 6810.216825065181, 6811.4550835934, 6816.420604248694, 6836.248012718696, 6548.639824809681, 6596.175478065242, 6627.701753421204, 6634.270230274569, 6640.867182656223, 6637.269900311058, 6640.701168447335, 6644.60132392058, 6644.7009884554345, 6648.700808463534, 6315.842103947254, 6426.710798014007, 6482.416582507597, 6484.967575162094, 6510.414062734377, 6621.834454138685, 6628.304028076983, 6629.03878937561, 6645.302243264581, 6648.301928297459, 6418.839529011625, 6466.418022378009, 6466.838329041811, 6482.416582507597, 6502.60984340941], "unit": "score", "name": "prototype.html", "value": 4931.095039302373}, {"lowerIsBetter": false, "replicates": [614.7510258345369, 628.5455297064962, 640.1006585747024, 690.76168721791, 699.1365663405696, 12731.490740370386, 12777.233365998047, 12878.742425151515, 12914.418851151686, 12929.612111636654, 13067.346632668352, 13879.722405551884, 14231.501897433593, 14234.644133896658, 14248.572542823731, 820.8358328334342, 826.0541679776652, 830.1408042675831, 830.4602008694367, 849.0702680564772, 831.4221615976899, 836.6569706420369, 843.4348986179275, 845.3913182508614, 846.7459762071385, 867.635593050917, 868.0885070675797, 871.2115535440405, 871.9258862996621, 875.8160786234898, 861.0356400831047, 862.7368652561029, 862.7454900804278, 863.3956230638547, 865.9826803463927, 640.8686219325074, 641.7400952614199, 642.6818724731241, 643.5237923936254, 643.7811144210943, 13871.098378605358, 13973.441062357493, 13982.091164074303, 14055.016148869583, 14073.718525629532, 12371.319577423239, 12568.560100396442, 12795.48818047277, 12907.483700651963, 13103.017273704416, 9699.612015519371, 9897.978518644142, 10008.549615267331, 10105.747356316077, 10113.24150688694, 3480.686738193575, 3510.824458777051, 3533.452314891196, 3562.7327950403565, 3582.5342705448384, 50006.499935000546, 50553.74723126397, 50652.74673626608, 50731.49268507305, 50874.0, 9796.314258001872, 10053.0, 10133.543990520297, 10185.592576297013, 10241.129503992095, 18346.908265458853, 18349.541261468305, 18372.632547348978, 18379.08104594765, 18437.815621843878, 7251.274872512812, 7340.669669864869, 7438.516496427823, 7454.105507339154, 7489.775306740807, 4167.74993500391, 4314.590113939171, 4370.584794444522, 4379.277419225792, 4431.468223813163, 3022.486177349856, 3057.3426713256313, 3067.877284908623, 3070.9846450767604, 3081.0448760884196, 564.5540023381565, 566.9943300567024, 568.7867049856304, 571.4171545024052, 578.1905332534401, 533.5518164741636, 654.6759354119646, 661.2131563439588, 666.5600703535644, 683.4088513435843, 8734.86897696535, 9234.584443700049, 9250.398724082914, 9278.95360523193, 9322.25421966241, 587.9382664820217, 600.9008513595295, 619.0126747837193, 669.3239827773983, 710.0804458226609, 4037.8384864605673, 4127.277726397869, 4139.3180726114415, 4195.622393984495, 4338.826446942087, 54136.0, 56979.715101425056, 57346.0, 57409.71295143497, 57777.0, 48480.7575962125, 48872.5112748875, 48877.75561122171, 49157.508424916006, 49870.25194622084, 44737.0, 45342.0, 45715.31427028531, 46353.7682311593, 46588.99999999932, 8326.167383261625, 8478.491290522588, 8589.355798315026, 8639.827203456021, 8715.738527844174, 32640.183995400304, 33119.0, 33413.49879751854, 33415.33169336648, 34857.47713784346, 40787.59212407838, 40841.38737918993, 43308.78345608252, 44430.55569444264, 44807.551924480336, 10549.525271362654, 10661.680149595524, 10734.248602598056, 10774.653168353956, 11088.168387370819, 11661.416929153678, 11742.17804753659, 11872.643820685393, 11881.702957426134, 11929.522819087138, 11012.17408694367, 11300.660980170607, 11578.247413918069, 11612.419379030845, 11632.127590430582, 10200.693979180636, 10616.469176540988, 10740.892591074302, 11011.669649910515, 11382.430878456209, 10929.890701092887, 11082.667519974413, 11430.371329576954, 11522.423878806194, 11609.419529023684, 8812.779680508038, 8832.51421171816, 9040.593173307085, 9102.271818254656, 9188.954055229948, 8400.87398689008, 8482.533460659723, 8814.51520166397, 8984.281257499253, 9604.807903841744], "unit": "score", "name": "yui.html", "value": 6251.265639993784}], "name": "dromaeo_css", "value": 7040.874077132657}, {"lowerIsBetter": true, "subtests": [{"lowerIsBetter": true, "replicates": [112.0, 106.0, 111.0, 111.0, 112.0, 124.0, 112.0, 113.0, 112.0, 112.0], "unit": "score", "name": "ai-astar", "value": 112.5}, {"lowerIsBetter": true, "replicates": [150.0, 125.0, 161.0, 168.0, 146.0, 162.0, 150.0, 130.0, 164.0, 128.0], "unit": "score", "name": "audio-beat-detection", "value": 148.4}, {"lowerIsBetter": true, "replicates": [164.0, 161.0, 162.0, 164.0, 162.0, 163.0, 161.0, 167.0, 166.0, 162.0], "unit": "score", "name": "audio-dft", "value": 163.2}, {"lowerIsBetter": true, "replicates": [72.0, 74.0, 73.0, 75.0, 73.0, 152.0, 75.0, 75.0, 74.0, 77.0], "unit": "score", "name": "audio-fft", "value": 82.0}, {"lowerIsBetter": true, "replicates": [93.0, 93.0, 148.0, 93.0, 93.0, 93.0, 140.0, 93.0, 95.0, 138.0], "unit": "score", "name": "audio-oscillator", "value": 107.9}, {"lowerIsBetter": true, "replicates": [118.0, 118.0, 118.0, 120.0, 117.0, 117.0, 118.0, 117.0, 118.0, 117.0], "unit": "score", "name": "imaging-gaussian-blur", "value": 117.8}, {"lowerIsBetter": true, "replicates": [153.0, 147.0, 146.0, 146.0, 146.0, 146.0, 147.0, 146.0, 146.0, 146.0], "unit": "score", "name": "imaging-darkroom", "value": 146.9}, {"lowerIsBetter": true, "replicates": [96.0, 96.0, 96.0, 96.0, 97.0, 97.0, 96.0, 95.0, 96.0, 99.0], "unit": "score", "name": "imaging-desaturate", "value": 96.4}, {"lowerIsBetter": true, "replicates": [58.0, 58.0, 61.0, 65.0, 59.0, 58.0, 60.0, 69.0, 56.0, 55.0], "unit": "score", "name": "json-parse-financial", "value": 59.9}, {"lowerIsBetter": true, "replicates": [67.0, 68.0, 66.0, 67.0, 67.0, 70.0, 67.0, 68.0, 67.0, 67.0], "unit": "score", "name": "json-stringify-tinderbox", "value": 67.4}, {"lowerIsBetter": true, "replicates": [82.0, 91.0, 90.0, 83.0, 85.0, 83.0, 85.0, 83.0, 83.0, 91.0], "unit": "score", "name": "stanford-crypto-aes", "value": 85.6}, {"lowerIsBetter": true, "replicates": [124.0, 116.0, 121.0, 118.0, 128.0, 122.0, 124.0, 121.0, 123.0, 119.0], "unit": "score", "name": "stanford-crypto-ccm", "value": 121.6}, {"lowerIsBetter": true, "replicates": [141.0, 152.0, 155.0, 150.0, 155.0, 152.0, 153.0, 148.0, 143.0, 140.0], "unit": "score", "name": "stanford-crypto-pbkdf2", "value": 148.9}, {"lowerIsBetter": true, "replicates": [76.0, 68.0, 71.0, 76.0, 72.0, 69.0, 68.0, 68.0, 72.0, 68.0], "unit": "score", "name": "stanford-crypto-sha256-iterative", "value": 70.8}], "name": "kraken", "value": 1529.3}]} 02:08:43 INFO - Return code: 0 02:08:43 INFO - Validating PERFHERDER_DATA against /builds/slave/test-pgo/build/tests/talos/treeherder-schemas/performance-artifact.json 02:08:43 ERROR - # TBPL SUCCESS # 02:08:43 INFO - Running post-action listener: _resource_record_post_action 02:08:43 INFO - Running post-run listener: _resource_record_post_run 02:08:44 INFO - Total resource usage - Wall time: 1192s; CPU: 13.0%; Read bytes: 16384; Write bytes: 292675584; Read time: 64; Write time: 733652 02:08:44 INFO - install - Wall time: 16s; CPU: 13.0%; Read bytes: 0; Write bytes: 9949184; Read time: 0; Write time: 1656 02:08:44 INFO - run-tests - Wall time: 1176s; CPU: 13.0%; Read bytes: 16384; Write bytes: 282726400; Read time: 64; Write time: 731996 02:08:44 INFO - Running post-run listener: _upload_blobber_files 02:08:44 INFO - Blob upload gear active. 02:08:44 INFO - Preparing to upload files from /builds/slave/test-pgo/build/blobber_upload_dir. 02:08:44 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 02:08:44 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', 'Mozilla-Aurora', '-d', '/builds/slave/test-pgo/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test-pgo/build/uploaded_files.json'] 02:08:44 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 Mozilla-Aurora -d /builds/slave/test-pgo/build/blobber_upload_dir --output-manifest /builds/slave/test-pgo/build/uploaded_files.json 02:08:44 INFO - (blobuploader) - INFO - Open directory for files ... 02:08:44 INFO - (blobuploader) - INFO - Uploading /builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs-e10s_raw.log ... 02:08:44 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 02:08:44 INFO - (blobuploader) - INFO - Uploading, attempt #1. 02:08:45 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_raw.log: uploaded 02:08:45 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 02:08:45 INFO - (blobuploader) - INFO - Done attempting. 02:08:45 INFO - (blobuploader) - INFO - Uploading /builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log ... 02:08:45 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 02:08:45 INFO - (blobuploader) - INFO - Uploading, attempt #1. 02:08:46 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_errorsummary.log: uploaded 02:08:46 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 02:08:46 INFO - (blobuploader) - INFO - Done attempting. 02:08:46 INFO - (blobuploader) - INFO - Iteration through files over. 02:08:46 INFO - Return code: 0 02:08:46 INFO - rmtree: /builds/slave/test-pgo/build/uploaded_files.json 02:08:46 INFO - retry: Calling remove with args: ('/builds/slave/test-pgo/build/uploaded_files.json',), kwargs: {}, attempt #1 02:08:46 INFO - Setting buildbot property blobber_files to {"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/26400e50ede40022300ccdd737f2ef480e1ab48749f77fffb5e4a02747d9c6738eeda1ef14260205438a57432802327bc663d99e508f630258bc311614488d24", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/0868651dc2617b406c59e2e00095512bda14fcc1b73d82cd63851c5c2627d5d2c75a29fa2ccc22a95b9ce07d783474a75b433fc3f4732616b2e4e4cfb8b548b6"} 02:08:46 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test-pgo/properties/blobber_files 02:08:46 INFO - Writing to file /builds/slave/test-pgo/properties/blobber_files 02:08:46 INFO - Contents: 02:08:46 INFO - blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/26400e50ede40022300ccdd737f2ef480e1ab48749f77fffb5e4a02747d9c6738eeda1ef14260205438a57432802327bc663d99e508f630258bc311614488d24", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/0868651dc2617b406c59e2e00095512bda14fcc1b73d82cd63851c5c2627d5d2c75a29fa2ccc22a95b9ce07d783474a75b433fc3f4732616b2e4e4cfb8b548b6"} 02:08:46 INFO - Running post-run listener: copy_logs_to_upload_dir 02:08:46 INFO - Copying logs to upload dir... 02:08:46 INFO - mkdir: /builds/slave/test-pgo/build/upload/logs 02:08:46 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1264.489129 ========= master_lag: 0.02 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 4 secs) (at 2016-03-08 02:08:46.445769) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-03-08 02:08:46.449683) ========= 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=df17445c3590ff7897617a0e00000225-1457430363.597437-543552692 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/26400e50ede40022300ccdd737f2ef480e1ab48749f77fffb5e4a02747d9c6738eeda1ef14260205438a57432802327bc663d99e508f630258bc311614488d24", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/0868651dc2617b406c59e2e00095512bda14fcc1b73d82cd63851c5c2627d5d2c75a29fa2ccc22a95b9ce07d783474a75b433fc3f4732616b2e4e4cfb8b548b6"} build_url:https://queue.taskcluster.net/v1/task/DXC_oMDVQqezRTaaZpA3IQ/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.011359 build_url: 'https://queue.taskcluster.net/v1/task/DXC_oMDVQqezRTaaZpA3IQ/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2' blobber_files: '{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/26400e50ede40022300ccdd737f2ef480e1ab48749f77fffb5e4a02747d9c6738eeda1ef14260205438a57432802327bc663d99e508f630258bc311614488d24", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/0868651dc2617b406c59e2e00095512bda14fcc1b73d82cd63851c5c2627d5d2c75a29fa2ccc22a95b9ce07d783474a75b433fc3f4732616b2e4e4cfb8b548b6"}' ========= master_lag: 0.01 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-03-08 02:08:46.474238) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-03-08 02:08:46.474567) ========= 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=df17445c3590ff7897617a0e00000225-1457430363.597437-543552692 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004532 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-03-08 02:08:46.559737) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-03-08 02:08:46.560046) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-03-08 02:08:46.560364) ========= ========= Total master_lag: 0.46 =========