builder: fx-team_ubuntu64_hw_test-dromaeojs slave: talos-linux64-ix-039 starttime: 1447951972.28 results: success (0) buildid: 20151119072803 builduid: b181926fed7a47508c9ea336b3e2ed65 revision: d052d9447bf90d0fedaae937afb76e672ca6d49b ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2015-11-19 08:52:52.280195) ========= master: http://buildbot-master104.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2015-11-19 08:52:52.280645) ========= ========= Started set props: basedir (results: 0, elapsed: 0 secs) (at 2015-11-19 08:52:52.280961) ========= bash -c pwd in dir /builds/slave/test/. (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 SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=6e558709db315bacd2260379000001b6-1447951971.970899-241625982 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False /builds/slave/test program finished with exit code 0 elapsedTime=0.003478 basedir: '/builds/slave/test' ========= master_lag: 0.01 ========= ========= Finished set props: basedir (results: 0, elapsed: 0 secs) (at 2015-11-19 08:52:52.295567) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2015-11-19 08:52:52.295854) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2015-11-19 08:52:52.304129) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-11-19 08:52:52.304406) ========= rm -rf properties in dir /builds/slave/test/. (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 SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=6e558709db315bacd2260379000001b6-1447951971.970899-241625982 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.003776 ========= master_lag: 0.04 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-11-19 08:52:52.351370) ========= ========= Started set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2015-11-19 08:52:52.351634) ========= script_repo_url: https://hg.mozilla.org/build/mozharness ========= Finished set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2015-11-19 08:52:52.351991) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2015-11-19 08:52:52.352280) ========= 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/. (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 SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=6e558709db315bacd2260379000001b6-1447951971.970899-241625982 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2015-11-19 08:52:52-- 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% 77.0M=0s 2015-11-19 08:52:52 (77.0 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.181326 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2015-11-19 08:52:52.545567) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-11-19 08:52:52.545886) ========= rm -rf scripts in dir /builds/slave/test/. (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 SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=6e558709db315bacd2260379000001b6-1447951971.970899-241625982 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.019923 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-11-19 08:52:52.595468) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2015-11-19 08:52:52.595947) ========= bash -c 'python archiver_client.py mozharness --repo integration/fx-team --rev d052d9447bf90d0fedaae937afb76e672ca6d49b --destination scripts --debug' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', u'python archiver_client.py mozharness --repo integration/fx-team --rev d052d9447bf90d0fedaae937afb76e672ca6d49b --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 SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=6e558709db315bacd2260379000001b6-1447951971.970899-241625982 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2015-11-19 08:52:53,025 truncating revision to first 12 chars 2015-11-19 08:52:53,025 Setting DEBUG logging. 2015-11-19 08:52:53,025 attempt 1/10 2015-11-19 08:52:53,025 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/integration/fx-team/d052d9447bf9?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2015-11-19 08:52:53,519 unpacking tar archive at: fx-team-d052d9447bf9/testing/mozharness/ program finished with exit code 0 elapsedTime=0.807896 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2015-11-19 08:52:53.416860) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2015-11-19 08:52:53.417185) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2015-11-19 08:52:53.426425) ========= ========= Started tinderboxprint_script_revlink (results: 0, elapsed: 0 secs) (at 2015-11-19 08:52:53.426702) ========= TinderboxPrint: script_revlink: https://hg.mozilla.org/build/mozharness/rev/production ========= Finished tinderboxprint_script_revlink (results: 0, elapsed: 0 secs) (at 2015-11-19 08:52:53.427127) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 7 secs) (at 2015-11-19 08:52:53.427415) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Fx-Team-Non-PGO --system-bits 64 --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Fx-Team-Non-PGO in dir /builds/slave/test/. (timeout 3600 secs) (maxTime 7200 secs) watching logfiles {} argv: ['/tools/buildbot/bin/python', 'scripts/scripts/talos_script.py', '--suite', 'dromaeojs', '--add-option', '--webServer,localhost', '--branch-name', 'Fx-Team-Non-PGO', '--system-bits', '64', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Fx-Team-Non-PGO'] 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/buildprops.json PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=6e558709db315bacd2260379000001b6-1447951971.970899-241625982 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 08:52:53 INFO - MultiFileLogger online at 20151119 08:52:53 in /builds/slave/test 08:52:53 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Fx-Team-Non-PGO --system-bits 64 --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Fx-Team-Non-PGO 08:52:53 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 08:52:53 INFO - {'append_to_log': False, 08:52:53 INFO - 'base_work_dir': '/builds/slave/test', 08:52:53 INFO - 'blob_upload_branch': 'Fx-Team-Non-PGO', 08:52:53 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 08:52:53 INFO - 'branch': 'Fx-Team-Non-PGO', 08:52:53 INFO - 'buildbot_json_path': 'buildprops.json', 08:52:53 INFO - 'config_files': ('talos/linux_config.py',), 08:52:53 INFO - 'default_actions': ('clobber', 08:52:53 INFO - 'read-buildbot-config', 08:52:53 INFO - 'download-and-extract', 08:52:53 INFO - 'populate-webroot', 08:52:53 INFO - 'create-virtualenv', 08:52:53 INFO - 'install', 08:52:53 INFO - 'run-tests'), 08:52:53 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 08:52:53 INFO - 'download_minidump_stackwalk': True, 08:52:53 INFO - 'download_symbols': 'ondemand', 08:52:53 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 08:52:53 INFO - 'tooltool.py': '/tools/tooltool.py', 08:52:53 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 08:52:53 INFO - '/tools/misc-python/virtualenv.py')}, 08:52:53 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 08:52:53 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 08:52:53 INFO - 'installer_path': 'installer.exe', 08:52:53 INFO - 'log_level': 'info', 08:52:53 INFO - 'log_name': 'talos', 08:52:53 INFO - 'log_to_console': True, 08:52:53 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 08:52:53 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 08:52:53 INFO - 'opt_config_files': (), 08:52:53 INFO - 'pip_index': False, 08:52:53 INFO - 'sps_profile': False, 08:52:53 INFO - 'sps_profile_interval': 0, 08:52:53 INFO - 'suite': 'dromaeojs', 08:52:53 INFO - 'system_bits': '64', 08:52:53 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 08:52:53 INFO - 'title': 'talos-linux64-ix-039', 08:52:53 INFO - 'tooltool_cache': '/builds/tooltool_cache', 08:52:53 INFO - 'use_talos_json': True, 08:52:53 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 08:52:53 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 08:52:53 INFO - 'work_dir': 'build'} 08:52:53 INFO - ##### 08:52:53 INFO - ##### Running clobber step. 08:52:53 INFO - ##### 08:52:53 INFO - Running pre-action listener: _resource_record_pre_action 08:52:53 INFO - Running main action method: clobber 08:52:53 INFO - rmtree: /builds/slave/test/build 08:52:53 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 08:52:54 INFO - Running post-action listener: _resource_record_post_action 08:52:54 INFO - ##### 08:52:54 INFO - ##### Running read-buildbot-config step. 08:52:54 INFO - ##### 08:52:54 INFO - Running pre-action listener: _resource_record_pre_action 08:52:54 INFO - Running main action method: read_buildbot_config 08:52:54 INFO - Using buildbot properties: 08:52:54 INFO - { 08:52:54 INFO - "properties": { 08:52:54 INFO - "buildnumber": 1111, 08:52:54 INFO - "product": "firefox", 08:52:54 INFO - "script_repo_revision": "production", 08:52:54 INFO - "builddir": "fx-team_ubuntu64_hw_test-dromaeojs", 08:52:54 INFO - "repository": "", 08:52:54 INFO - "buildername": "Ubuntu HW 12.04 x64 fx-team talos dromaeojs", 08:52:54 INFO - "buildid": "20151119072803", 08:52:54 INFO - "slavename": "talos-linux64-ix-039", 08:52:54 INFO - "pgo_build": "False", 08:52:54 INFO - "basedir": "/builds/slave/test", 08:52:54 INFO - "project": "", 08:52:54 INFO - "platform": "ubuntu64_hw", 08:52:54 INFO - "master": "http://buildbot-master104.bb.releng.scl3.mozilla.com:8201/", 08:52:54 INFO - "slavebuilddir": "test", 08:52:54 INFO - "scheduler": "tests-fx-team-linux64-talos", 08:52:54 INFO - "branch": "fx-team", 08:52:54 INFO - "repo_path": "integration/fx-team", 08:52:54 INFO - "stage_platform": "linux64", 08:52:54 INFO - "builduid": "b181926fed7a47508c9ea336b3e2ed65", 08:52:54 INFO - "revision": "d052d9447bf90d0fedaae937afb76e672ca6d49b" 08:52:54 INFO - }, 08:52:54 INFO - "sourcestamp": { 08:52:54 INFO - "repository": "", 08:52:54 INFO - "hasPatch": false, 08:52:54 INFO - "project": "", 08:52:54 INFO - "branch": "fx-team-linux64-talos", 08:52:54 INFO - "changes": [ 08:52:54 INFO - { 08:52:54 INFO - "category": null, 08:52:54 INFO - "files": [ 08:52:54 INFO - { 08:52:54 INFO - "url": null, 08:52:54 INFO - "name": "https://queue.taskcluster.net/v1/task/yCbnT5LETxK90Kq4qrGFyw/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2" 08:52:54 INFO - } 08:52:54 INFO - ], 08:52:54 INFO - "repository": "", 08:52:54 INFO - "rev": "d052d9447bf90d0fedaae937afb76e672ca6d49b", 08:52:54 INFO - "who": "cbook@mozilla.com", 08:52:54 INFO - "when": 1447949590, 08:52:54 INFO - "number": 6683378, 08:52:54 INFO - "comments": "Backed out changeset ddb0ac65cba2 (bug 1168113) for possibly causing crashes on fx-team on a CLOSED TREE", 08:52:54 INFO - "project": "", 08:52:54 INFO - "at": "Thu 19 Nov 2015 08:13:10", 08:52:54 INFO - "branch": "fx-team-linux64-talos", 08:52:54 INFO - "revlink": "", 08:52:54 INFO - "properties": [ 08:52:54 INFO - [ 08:52:54 INFO - "buildid", 08:52:54 INFO - "20151119072803", 08:52:54 INFO - "Change" 08:52:54 INFO - ], 08:52:54 INFO - [ 08:52:54 INFO - "builduid", 08:52:54 INFO - "b181926fed7a47508c9ea336b3e2ed65", 08:52:54 INFO - "Change" 08:52:54 INFO - ], 08:52:54 INFO - [ 08:52:54 INFO - "pgo_build", 08:52:54 INFO - "False", 08:52:54 INFO - "Change" 08:52:54 INFO - ] 08:52:54 INFO - ], 08:52:54 INFO - "revision": "d052d9447bf90d0fedaae937afb76e672ca6d49b" 08:52:54 INFO - } 08:52:54 INFO - ], 08:52:54 INFO - "revision": "d052d9447bf90d0fedaae937afb76e672ca6d49b" 08:52:54 INFO - } 08:52:54 INFO - } 08:52:54 INFO - Found installer url https://queue.taskcluster.net/v1/task/yCbnT5LETxK90Kq4qrGFyw/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2. 08:52:54 INFO - Running post-action listener: _resource_record_post_action 08:52:54 INFO - ##### 08:52:54 INFO - ##### Running download-and-extract step. 08:52:54 INFO - ##### 08:52:54 INFO - Running pre-action listener: _resource_record_pre_action 08:52:54 INFO - Running main action method: download_and_extract 08:52:54 INFO - mkdir: /builds/slave/test/build/tests 08:52:54 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 08:52:54 INFO - https://queue.taskcluster.net/v1/task/yCbnT5LETxK90Kq4qrGFyw/artifacts/public/build/test_packages.json matches https://queue.taskcluster.net 08:52:54 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/yCbnT5LETxK90Kq4qrGFyw/artifacts/public/build/test_packages.json 08:52:54 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/yCbnT5LETxK90Kq4qrGFyw/artifacts/public/build/test_packages.json 08:52:54 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/yCbnT5LETxK90Kq4qrGFyw/artifacts/public/build/test_packages.json to /builds/slave/test/build/test_packages.json 08:52:54 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/yCbnT5LETxK90Kq4qrGFyw/artifacts/public/build/test_packages.json', 'file_name': '/builds/slave/test/build/test_packages.json'}, attempt #1 08:52:55 INFO - Downloaded 1302 bytes. 08:52:55 INFO - Reading from file /builds/slave/test/build/test_packages.json 08:52:55 INFO - Using the following test package requirements: 08:52:55 INFO - {u'common': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip'], 08:52:55 INFO - u'cppunittest': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', 08:52:55 INFO - u'firefox-45.0a1.en-US.linux-x86_64.cppunittest.tests.zip'], 08:52:55 INFO - u'jittest': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', 08:52:55 INFO - u'jsshell-linux-x86_64.zip'], 08:52:55 INFO - u'mochitest': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', 08:52:55 INFO - u'firefox-45.0a1.en-US.linux-x86_64.mochitest.tests.zip'], 08:52:55 INFO - u'mozbase': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip'], 08:52:55 INFO - u'reftest': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', 08:52:55 INFO - u'firefox-45.0a1.en-US.linux-x86_64.reftest.tests.zip'], 08:52:55 INFO - u'talos': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', 08:52:55 INFO - u'firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip'], 08:52:55 INFO - u'web-platform': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', 08:52:55 INFO - u'firefox-45.0a1.en-US.linux-x86_64.web-platform.tests.zip'], 08:52:55 INFO - u'webapprt': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip'], 08:52:55 INFO - u'xpcshell': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', 08:52:55 INFO - u'firefox-45.0a1.en-US.linux-x86_64.xpcshell.tests.zip']} 08:52:55 INFO - Downloading packages: [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 08:52:55 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 08:52:55 INFO - https://queue.taskcluster.net/v1/task/yCbnT5LETxK90Kq4qrGFyw/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 08:52:55 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/yCbnT5LETxK90Kq4qrGFyw/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip 08:52:55 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/yCbnT5LETxK90Kq4qrGFyw/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip 08:52:55 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/yCbnT5LETxK90Kq4qrGFyw/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip 08:52:55 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/yCbnT5LETxK90Kq4qrGFyw/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 08:52:56 INFO - Downloaded 21336298 bytes. 08:52:56 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip'] in /builds/slave/test/build/tests 08:52:56 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip 08:52:56 INFO - Calling ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip'] with output_timeout 1760 08:52:57 INFO - Return code: 0 08:52:57 INFO - Downloading packages: [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', u'firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip'] for test suite category: talos 08:52: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')]} 08:52:57 INFO - https://queue.taskcluster.net/v1/task/yCbnT5LETxK90Kq4qrGFyw/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 08:52:57 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/yCbnT5LETxK90Kq4qrGFyw/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip 08:52:57 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/yCbnT5LETxK90Kq4qrGFyw/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip 08:52:57 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/yCbnT5LETxK90Kq4qrGFyw/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip 08:52:57 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/yCbnT5LETxK90Kq4qrGFyw/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 08:53:03 INFO - Downloaded 21336298 bytes. 08:53:03 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip'] in /builds/slave/test/build/tests 08:53:03 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip 08:53:03 INFO - Calling ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip'] with output_timeout 1760 08:53:04 INFO - Return code: 0 08:53:04 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 08:53:04 INFO - https://queue.taskcluster.net/v1/task/yCbnT5LETxK90Kq4qrGFyw/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip matches https://queue.taskcluster.net 08:53:04 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/yCbnT5LETxK90Kq4qrGFyw/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip 08:53:04 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/yCbnT5LETxK90Kq4qrGFyw/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip 08:53:04 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/yCbnT5LETxK90Kq4qrGFyw/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip to /builds/slave/test/build/firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip 08:53:04 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/yCbnT5LETxK90Kq4qrGFyw/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip'}, attempt #1 08:53:05 INFO - Downloaded 11130997 bytes. 08:53:05 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip'] in /builds/slave/test/build/tests 08:53:05 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip 08:53:05 INFO - Calling ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip'] with output_timeout 1760 08:53:06 INFO - Return code: 0 08:53:06 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 08:53:06 INFO - https://queue.taskcluster.net/v1/task/yCbnT5LETxK90Kq4qrGFyw/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2 matches https://queue.taskcluster.net 08:53:06 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/yCbnT5LETxK90Kq4qrGFyw/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2 08:53:06 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/yCbnT5LETxK90Kq4qrGFyw/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2 08:53:06 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/yCbnT5LETxK90Kq4qrGFyw/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2 to /builds/slave/test/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2 08:53:06 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/yCbnT5LETxK90Kq4qrGFyw/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2', 'file_name': '/builds/slave/test/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2'}, attempt #1 08:53:07 INFO - Downloaded 55782655 bytes. 08:53:07 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/yCbnT5LETxK90Kq4qrGFyw/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2 08:53:07 INFO - mkdir: /builds/slave/test/properties 08:53:07 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 08:53:07 INFO - Writing to file /builds/slave/test/properties/build_url 08:53:07 INFO - Contents: 08:53:07 INFO - build_url:https://queue.taskcluster.net/v1/task/yCbnT5LETxK90Kq4qrGFyw/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2 08:53:07 INFO - Running post-action listener: _resource_record_post_action 08:53:07 INFO - Running post-action listener: set_extra_try_arguments 08:53:07 INFO - ##### 08:53:07 INFO - ##### Running populate-webroot step. 08:53:07 INFO - ##### 08:53:07 INFO - Running pre-action listener: _resource_record_pre_action 08:53:07 INFO - Running main action method: populate_webroot 08:53:07 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 08:53:07 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 08:53:07 INFO - 'remote-trobocheck2': {'talos_options': ['--fennecIDs', 08:53:07 INFO - '../fennec_ids.txt'], 08:53:07 INFO - 'tests': ['tcheck2']}, 08:53:07 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 08:53:07 INFO - '--tppagecycles', 08:53:07 INFO - '7'], 08:53:07 INFO - 'tests': ['tsvgm']}}, 08:53:07 INFO - 'suites': {'chromez': {'tests': ['tresize', 'tcanvasmark']}, 08:53:07 INFO - 'chromez-e10s': {'talos_options': ['--e10s'], 08:53:07 INFO - 'tests': ['tresize', 'tcanvasmark']}, 08:53:07 INFO - 'dromaeojs': {'tests': ['dromaeo_css', 'kraken', 'v8_7']}, 08:53:07 INFO - 'dromaeojs-e10s': {'talos_options': ['--e10s'], 08:53:07 INFO - 'tests': ['dromaeo_css', 'kraken', 'v8_7']}, 08:53:07 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 08:53:07 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 08:53:07 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 08:53:07 INFO - 'talos_options': ['--e10s'], 08:53:07 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 08:53:07 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 08:53:07 INFO - 'tests': ['damp', 'tps']}, 08:53:07 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 08:53:07 INFO - 'talos_options': ['--e10s'], 08:53:07 INFO - 'tests': ['damp', 'tps']}, 08:53:07 INFO - 'g3': {'tests': ['dromaeo_dom']}, 08:53:07 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 08:53:07 INFO - 'other': {'tests': ['a11yr', 08:53:07 INFO - 'ts_paint', 08:53:07 INFO - 'tpaint', 08:53:07 INFO - 'sessionrestore', 08:53:07 INFO - 'sessionrestore_no_auto_restore']}, 08:53:07 INFO - 'other-e10s': {'talos_options': ['--e10s'], 08:53:07 INFO - 'tests': ['a11yr', 08:53:07 INFO - 'ts_paint', 08:53:07 INFO - 'tpaint', 08:53:07 INFO - 'sessionrestore', 08:53:07 INFO - 'sessionrestore_no_auto_restore']}, 08:53:07 INFO - 'other-e10s_l64': {'talos_options': ['--e10s'], 08:53:07 INFO - 'tests': ['a11yr', 08:53:07 INFO - 'ts_paint', 08:53:07 INFO - 'tpaint', 08:53:07 INFO - 'sessionrestore', 08:53:07 INFO - 'sessionrestore_no_auto_restore']}, 08:53:07 INFO - 'other-e10s_nol64': {'talos_options': ['--e10s'], 08:53:07 INFO - 'tests': ['a11yr', 08:53:07 INFO - 'ts_paint', 08:53:07 INFO - 'tpaint', 08:53:07 INFO - 'sessionrestore', 08:53:07 INFO - 'sessionrestore_no_auto_restore']}, 08:53:07 INFO - 'other_l64': {'tests': ['a11yr', 08:53:07 INFO - 'ts_paint', 08:53:07 INFO - 'tpaint', 08:53:07 INFO - 'sessionrestore', 08:53:07 INFO - 'sessionrestore_no_auto_restore']}, 08:53:07 INFO - 'other_nol64': {'tests': ['a11yr', 08:53:07 INFO - 'ts_paint', 08:53:07 INFO - 'tpaint', 08:53:07 INFO - 'sessionrestore', 08:53:07 INFO - 'sessionrestore_no_auto_restore']}, 08:53:07 INFO - 'svgr': {'tests': ['tsvgx', 08:53:07 INFO - 'tsvgr_opacity', 08:53:07 INFO - 'tart', 08:53:07 INFO - 'tscrollx', 08:53:07 INFO - 'cart']}, 08:53:07 INFO - 'svgr-e10s': {'talos_options': ['--e10s'], 08:53:07 INFO - 'tests': ['tsvgx', 08:53:07 INFO - 'tsvgr_opacity', 08:53:07 INFO - 'tart', 08:53:07 INFO - 'tscrollx', 08:53:07 INFO - 'cart']}, 08:53:07 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 08:53:07 INFO - 'tests': ['tp5o']}, 08:53:07 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 08:53:07 INFO - 'talos_options': ['--e10s'], 08:53:07 INFO - 'tests': ['tp5o']}, 08:53:07 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 08:53:07 INFO - 'talos_options': ['--xperf_path', 08:53:07 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 08:53:07 INFO - 'tests': ['tp5n']}, 08:53:07 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 08:53:07 INFO - 'talos_options': ['--e10s', 08:53:07 INFO - '--xperf_path', 08:53:07 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 08:53:07 INFO - 'tests': ['tp5n']}}, 08:53:07 INFO - 'talos.zip': {'path': '', 08:53:07 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 08:53:07 INFO - Running post-action listener: _resource_record_post_action 08:53:07 INFO - ##### 08:53:07 INFO - ##### Running create-virtualenv step. 08:53:07 INFO - ##### 08:53:07 INFO - Running pre-action listener: _resource_record_pre_action 08:53:07 INFO - Running main action method: create_virtualenv 08:53:07 INFO - Creating virtualenv /builds/slave/test/build/venv 08:53:07 INFO - Running command: ['/tools/buildbot/bin/python', '/tools/misc-python/virtualenv.py', '--no-site-packages', '--distribute', '/builds/slave/test/build/venv'] in /builds/slave/test/build 08:53:07 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 08:53:07 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 08:53:07 INFO - Using real prefix '/usr' 08:53:07 INFO - New python executable in /builds/slave/test/build/venv/bin/python 08:53:08 INFO - Installing distribute.............................................................................................................................................................................................done. 08:53:10 INFO - Installing pip.................done. 08:53:10 INFO - Return code: 0 08:53:10 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 08:53: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')]} 08:53:10 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:53:10 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:53: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')]} 08:53:10 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:53:10 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:53:10 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--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 0x7fb32803cc70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x215c6c0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x220d900>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2253b70>, '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 0x22a4dc0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x22a5250>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '6e558709db315bacd2260379000001b6-1447951971.970899-241625982', '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', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 08:53:10 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--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/build 08:53:10 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --download-cache /builds/slave/test/build/venv/cache --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 08:53:10 INFO - Using env: {'DISPLAY': ':0', 08:53:10 INFO - 'HOME': '/home/cltbld', 08:53:10 INFO - 'LANG': 'en_US.UTF-8', 08:53:10 INFO - 'LANGUAGE': 'en_US:en', 08:53:10 INFO - 'LOGNAME': 'cltbld', 08:53:10 INFO - 'MAIL': '/var/mail/cltbld', 08:53:10 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:53:10 INFO - 'MOZ_NO_REMOTE': '1', 08:53:10 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:53:10 INFO - 'NO_EM_RESTART': '1', 08:53:10 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:53:10 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:53:10 INFO - 'PWD': '/builds/slave/test', 08:53:10 INFO - 'SHELL': '/bin/bash', 08:53:10 INFO - 'SHLVL': '1', 08:53:10 INFO - 'TERM': 'linux', 08:53:10 INFO - 'TMOUT': '86400', 08:53:10 INFO - 'USER': 'cltbld', 08:53:10 INFO - 'XDG_SESSION_COOKIE': '6e558709db315bacd2260379000001b6-1447951971.970899-241625982', 08:53:10 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:53:10 INFO - '_': '/tools/buildbot/bin/python'} 08:53:10 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:53:10 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 08:53:10 INFO - Cleaning up... 08:53:10 INFO - Return code: 0 08:53:10 INFO - Installing psutil>=0.7.1 into virtualenv /builds/slave/test/build/venv 08:53: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')]} 08:53:10 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:53:10 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:53: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')]} 08:53:10 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:53:10 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:53:10 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--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 0x7fb32803cc70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x215c6c0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x220d900>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2253b70>, '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 0x22a4dc0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x22a5250>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '6e558709db315bacd2260379000001b6-1447951971.970899-241625982', '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', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 08:53:10 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--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/build 08:53:10 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --download-cache /builds/slave/test/build/venv/cache --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 08:53:10 INFO - Using env: {'DISPLAY': ':0', 08:53:10 INFO - 'HOME': '/home/cltbld', 08:53:10 INFO - 'LANG': 'en_US.UTF-8', 08:53:10 INFO - 'LANGUAGE': 'en_US:en', 08:53:10 INFO - 'LOGNAME': 'cltbld', 08:53:10 INFO - 'MAIL': '/var/mail/cltbld', 08:53:10 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:53:10 INFO - 'MOZ_NO_REMOTE': '1', 08:53:10 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:53:10 INFO - 'NO_EM_RESTART': '1', 08:53:10 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:53:10 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:53:10 INFO - 'PWD': '/builds/slave/test', 08:53:10 INFO - 'SHELL': '/bin/bash', 08:53:10 INFO - 'SHLVL': '1', 08:53:10 INFO - 'TERM': 'linux', 08:53:10 INFO - 'TMOUT': '86400', 08:53:10 INFO - 'USER': 'cltbld', 08:53:10 INFO - 'XDG_SESSION_COOKIE': '6e558709db315bacd2260379000001b6-1447951971.970899-241625982', 08:53:10 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:53:10 INFO - '_': '/tools/buildbot/bin/python'} 08:53:10 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:53:10 INFO - Downloading/unpacking psutil>=0.7.1 08:53:10 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:53:10 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:53:10 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:53:10 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:53:10 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:53:10 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:53:12 INFO - Creating supposed download cache at /builds/slave/test/build/venv/cache 08:53:12 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fpsutil-3.1.1.tar.gz 08:53:12 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 08:53:12 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 08:53:12 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 08:53:12 INFO - Installing collected packages: psutil 08:53:12 INFO - Running setup.py install for psutil 08:53:12 INFO - building 'psutil._psutil_linux' extension 08:53:12 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 08:53:12 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 08:53:12 INFO - building 'psutil._psutil_posix' extension 08:53:12 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 08:53:12 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 08:53:12 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 08:53:12 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 08:53:12 INFO - Successfully installed psutil 08:53:12 INFO - Cleaning up... 08:53:12 INFO - Return code: 0 08:53:12 INFO - Installing mozsystemmonitor==0.0.0 into virtualenv /builds/slave/test/build/venv 08:53: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')]} 08:53:12 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:53:12 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:53: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')]} 08:53:12 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:53:12 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:53:12 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--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 0x7fb32803cc70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x215c6c0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x220d900>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2253b70>, '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 0x22a4dc0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x22a5250>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '6e558709db315bacd2260379000001b6-1447951971.970899-241625982', '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', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 08:53:12 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--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/build 08:53:12 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --download-cache /builds/slave/test/build/venv/cache --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 08:53:12 INFO - Using env: {'DISPLAY': ':0', 08:53:12 INFO - 'HOME': '/home/cltbld', 08:53:12 INFO - 'LANG': 'en_US.UTF-8', 08:53:12 INFO - 'LANGUAGE': 'en_US:en', 08:53:12 INFO - 'LOGNAME': 'cltbld', 08:53:12 INFO - 'MAIL': '/var/mail/cltbld', 08:53:12 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:53:12 INFO - 'MOZ_NO_REMOTE': '1', 08:53:12 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:53:12 INFO - 'NO_EM_RESTART': '1', 08:53:12 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:53:12 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:53:12 INFO - 'PWD': '/builds/slave/test', 08:53:12 INFO - 'SHELL': '/bin/bash', 08:53:12 INFO - 'SHLVL': '1', 08:53:12 INFO - 'TERM': 'linux', 08:53:12 INFO - 'TMOUT': '86400', 08:53:12 INFO - 'USER': 'cltbld', 08:53:12 INFO - 'XDG_SESSION_COOKIE': '6e558709db315bacd2260379000001b6-1447951971.970899-241625982', 08:53:12 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:53:12 INFO - '_': '/tools/buildbot/bin/python'} 08:53:12 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:53:12 INFO - Downloading/unpacking mozsystemmonitor==0.0.0 08:53:12 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:53:12 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:53:12 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:53:12 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:53:12 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:53:12 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:53:14 INFO - Downloading mozsystemmonitor-0.0.tar.gz 08:53:14 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fmozsystemmonitor-0.0.tar.gz 08:53:14 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 08:53:14 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=0.7.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.0.0) 08:53:14 INFO - Installing collected packages: mozsystemmonitor 08:53:14 INFO - Running setup.py install for mozsystemmonitor 08:53:14 INFO - Successfully installed mozsystemmonitor 08:53:14 INFO - Cleaning up... 08:53:14 INFO - Return code: 0 08:53:14 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 08:53:14 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 08:53:14 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:53:14 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:53:14 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 08:53:14 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:53:14 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:53:14 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--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 0x7fb32803cc70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x215c6c0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x220d900>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2253b70>, '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 0x22a4dc0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x22a5250>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '6e558709db315bacd2260379000001b6-1447951971.970899-241625982', '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', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 08:53:14 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--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/build 08:53:14 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --download-cache /builds/slave/test/build/venv/cache --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 08:53:14 INFO - Using env: {'DISPLAY': ':0', 08:53:14 INFO - 'HOME': '/home/cltbld', 08:53:14 INFO - 'LANG': 'en_US.UTF-8', 08:53:14 INFO - 'LANGUAGE': 'en_US:en', 08:53:14 INFO - 'LOGNAME': 'cltbld', 08:53:14 INFO - 'MAIL': '/var/mail/cltbld', 08:53:14 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:53:14 INFO - 'MOZ_NO_REMOTE': '1', 08:53:14 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:53:14 INFO - 'NO_EM_RESTART': '1', 08:53:14 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:53:14 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:53:14 INFO - 'PWD': '/builds/slave/test', 08:53:14 INFO - 'SHELL': '/bin/bash', 08:53:14 INFO - 'SHLVL': '1', 08:53:14 INFO - 'TERM': 'linux', 08:53:14 INFO - 'TMOUT': '86400', 08:53:14 INFO - 'USER': 'cltbld', 08:53:14 INFO - 'XDG_SESSION_COOKIE': '6e558709db315bacd2260379000001b6-1447951971.970899-241625982', 08:53:14 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:53:14 INFO - '_': '/tools/buildbot/bin/python'} 08:53:15 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:53:15 INFO - Downloading/unpacking blobuploader==1.2.4 08:53:15 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:53:15 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:53:15 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:53:15 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:53:15 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:53:15 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:53:16 INFO - Downloading blobuploader-1.2.4.tar.gz 08:53:16 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fblobuploader-1.2.4.tar.gz 08:53:16 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 08:53:16 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 08:53:16 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:53:16 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:53:16 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:53:16 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:53:16 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:53:16 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:53:16 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Frequests-1.2.3.tar.gz 08:53:16 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 08:53:17 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 08:53: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 08:53: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 08:53: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 08:53: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 08:53: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 08:53: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 08:53:17 INFO - Downloading docopt-0.6.1.tar.gz 08:53:17 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fdocopt-0.6.1.tar.gz 08:53:17 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 08:53:17 INFO - Installing collected packages: blobuploader, requests, docopt 08:53:17 INFO - Running setup.py install for blobuploader 08:53:17 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 08:53:17 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 08:53:17 INFO - Running setup.py install for requests 08:53:17 INFO - Running setup.py install for docopt 08:53:17 INFO - Successfully installed blobuploader requests docopt 08:53:17 INFO - Cleaning up... 08:53:17 INFO - Return code: 0 08:53:17 INFO - Installing None into virtualenv /builds/slave/test/build/venv 08:53: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')]} 08:53:17 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:53:17 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:53: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')]} 08:53:17 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:53:17 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:53:17 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--no-deps', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '-r', '/builds/slave/test/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 0x7fb32803cc70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x215c6c0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x220d900>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2253b70>, '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 0x22a4dc0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x22a5250>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/config', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '6e558709db315bacd2260379000001b6-1447951971.970899-241625982', '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', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 08:53:17 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--no-deps', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '-r', '/builds/slave/test/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/build/tests/config 08:53:17 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --no-deps --download-cache /builds/slave/test/build/venv/cache --timeout 120 -r /builds/slave/test/build/tests/config/mozbase_requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 08:53:17 INFO - Using env: {'DISPLAY': ':0', 08:53:17 INFO - 'HOME': '/home/cltbld', 08:53:17 INFO - 'LANG': 'en_US.UTF-8', 08:53:17 INFO - 'LANGUAGE': 'en_US:en', 08:53:17 INFO - 'LOGNAME': 'cltbld', 08:53:17 INFO - 'MAIL': '/var/mail/cltbld', 08:53:17 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:53:17 INFO - 'MOZ_NO_REMOTE': '1', 08:53:17 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:53:17 INFO - 'NO_EM_RESTART': '1', 08:53:17 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:53:17 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:53:17 INFO - 'PWD': '/builds/slave/test', 08:53:17 INFO - 'SHELL': '/bin/bash', 08:53:17 INFO - 'SHLVL': '1', 08:53:17 INFO - 'TERM': 'linux', 08:53:17 INFO - 'TMOUT': '86400', 08:53:17 INFO - 'USER': 'cltbld', 08:53:17 INFO - 'XDG_SESSION_COOKIE': '6e558709db315bacd2260379000001b6-1447951971.970899-241625982', 08:53:17 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:53:17 INFO - '_': '/tools/buildbot/bin/python'} 08:53:18 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:53:18 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 08:53:18 INFO - Running setup.py (path:/tmp/pip-7Lo8Hm-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 08:53:18 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 08:53:18 INFO - Running setup.py (path:/tmp/pip-mPC7Wd-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 08:53:18 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 08:53:18 INFO - Running setup.py (path:/tmp/pip-zLDBLq-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 08:53:18 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 08:53:18 INFO - Running setup.py (path:/tmp/pip-mVWC8G-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 08:53:18 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 08:53:18 INFO - Running setup.py (path:/tmp/pip-cDLsP6-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 08:53:18 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 08:53:18 INFO - Running setup.py (path:/tmp/pip-kO6KbN-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 08:53:18 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 08:53:18 INFO - Running setup.py (path:/tmp/pip-7osyPj-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 08:53:18 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 08:53:18 INFO - Running setup.py (path:/tmp/pip-uTl81T-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 08:53:18 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 08:53:18 INFO - Running setup.py (path:/tmp/pip-IRBamr-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 08:53:18 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 08:53:18 INFO - Running setup.py (path:/tmp/pip-e6OVMS-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 08:53:18 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 08:53:18 INFO - Running setup.py (path:/tmp/pip-tx462y-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 08:53:18 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 08:53:18 INFO - Running setup.py (path:/tmp/pip-zPd66B-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 08:53:19 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 08:53:19 INFO - Running setup.py (path:/tmp/pip-1LOwv3-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 08:53:19 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 08:53:19 INFO - Running setup.py (path:/tmp/pip-5KXIw8-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 08:53:19 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 08:53:19 INFO - Running setup.py (path:/tmp/pip-z1Mg0I-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 08:53:19 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 08:53:19 INFO - Running setup.py (path:/tmp/pip-1ARy_m-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 08:53:19 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 08:53:19 INFO - Running setup.py (path:/tmp/pip-F5X_VH-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 08:53:19 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 08:53:19 INFO - Running setup.py install for manifestparser 08:53:19 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 08:53:19 INFO - Running setup.py install for mozcrash 08:53:19 INFO - Running setup.py install for mozdebug 08:53:19 INFO - Running setup.py install for mozdevice 08:53:19 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 08:53:19 INFO - Installing dm script to /builds/slave/test/build/venv/bin 08:53:19 INFO - Running setup.py install for mozfile 08:53:19 INFO - Running setup.py install for mozhttpd 08:53:19 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 08:53:20 INFO - Running setup.py install for mozinfo 08:53:20 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 08:53:20 INFO - Running setup.py install for mozInstall 08:53:20 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 08:53:20 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 08:53:20 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 08:53:20 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 08:53:20 INFO - Running setup.py install for mozleak 08:53:20 INFO - Running setup.py install for mozlog 08:53:20 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 08:53:20 INFO - Running setup.py install for moznetwork 08:53:20 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 08:53:20 INFO - Running setup.py install for mozprocess 08:53:20 INFO - Running setup.py install for mozprofile 08:53:20 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 08:53:20 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 08:53:20 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 08:53:20 INFO - Running setup.py install for mozrunner 08:53:20 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 08:53:20 INFO - Running setup.py install for mozscreenshot 08:53:20 INFO - Running setup.py install for moztest 08:53:21 INFO - Running setup.py install for mozversion 08:53:21 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 08:53:21 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 08:53:21 INFO - Cleaning up... 08:53:21 INFO - Return code: 0 08:53:21 INFO - Installing None into virtualenv /builds/slave/test/build/venv 08:53: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')]} 08:53:21 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:53:21 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:53: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')]} 08:53:21 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:53:21 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:53:21 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '-r', '/builds/slave/test/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 0x7fb32803cc70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x215c6c0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x220d900>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2253b70>, '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 0x22a4dc0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x22a5250>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/config', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '6e558709db315bacd2260379000001b6-1447951971.970899-241625982', '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', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 08:53:21 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '-r', '/builds/slave/test/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/build/tests/config 08:53:21 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --download-cache /builds/slave/test/build/venv/cache --timeout 120 -r /builds/slave/test/build/tests/config/mozbase_requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 08:53:21 INFO - Using env: {'DISPLAY': ':0', 08:53:21 INFO - 'HOME': '/home/cltbld', 08:53:21 INFO - 'LANG': 'en_US.UTF-8', 08:53:21 INFO - 'LANGUAGE': 'en_US:en', 08:53:21 INFO - 'LOGNAME': 'cltbld', 08:53:21 INFO - 'MAIL': '/var/mail/cltbld', 08:53:21 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:53:21 INFO - 'MOZ_NO_REMOTE': '1', 08:53:21 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:53:21 INFO - 'NO_EM_RESTART': '1', 08:53:21 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:53:21 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:53:21 INFO - 'PWD': '/builds/slave/test', 08:53:21 INFO - 'SHELL': '/bin/bash', 08:53:21 INFO - 'SHLVL': '1', 08:53:21 INFO - 'TERM': 'linux', 08:53:21 INFO - 'TMOUT': '86400', 08:53:21 INFO - 'USER': 'cltbld', 08:53:21 INFO - 'XDG_SESSION_COOKIE': '6e558709db315bacd2260379000001b6-1447951971.970899-241625982', 08:53:21 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:53:21 INFO - '_': '/tools/buildbot/bin/python'} 08:53:21 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:53:21 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 08:53:21 INFO - Running setup.py (path:/tmp/pip-sGNFAX-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 08:53:21 INFO - Requirement already satisfied (use --upgrade to upgrade): manifestparser==1.1 from file:///builds/slave/test/build/tests/mozbase/manifestparser in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 1)) 08:53:21 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 08:53:21 INFO - Running setup.py (path:/tmp/pip-FzCbJs-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 08:53:21 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash==0.16 from file:///builds/slave/test/build/tests/mozbase/mozcrash in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 08:53:21 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 08:53:21 INFO - Running setup.py (path:/tmp/pip-vbEzz3-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 08:53:21 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdebug==0.1 from file:///builds/slave/test/build/tests/mozbase/mozdebug in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 3)) 08:53:21 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 08:53:21 INFO - Running setup.py (path:/tmp/pip-AxG7oD-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 08:53:21 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdevice==0.47 from file:///builds/slave/test/build/tests/mozbase/mozdevice in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 08:53:21 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 08:53:21 INFO - Running setup.py (path:/tmp/pip-UzQV9L-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 08:53:21 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile==1.2 from file:///builds/slave/test/build/tests/mozbase/mozfile in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 5)) 08:53:21 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 08:53:21 INFO - Running setup.py (path:/tmp/pip-TeNtJi-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 08:53:21 INFO - Requirement already satisfied (use --upgrade to upgrade): mozhttpd==0.7 from file:///builds/slave/test/build/tests/mozbase/mozhttpd in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 6)) 08:53:21 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 08:53:21 INFO - Running setup.py (path:/tmp/pip-ycIAMc-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 08:53:21 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo==0.9 from file:///builds/slave/test/build/tests/mozbase/mozinfo in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 7)) 08:53:21 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 08:53:21 INFO - Running setup.py (path:/tmp/pip-9Xkp8B-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 08:53:21 INFO - Requirement already satisfied (use --upgrade to upgrade): mozInstall==1.12 from file:///builds/slave/test/build/tests/mozbase/mozinstall in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 8)) 08:53:21 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 08:53:21 INFO - Running setup.py (path:/tmp/pip-aK6ZpN-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 08:53:22 INFO - Requirement already satisfied (use --upgrade to upgrade): mozleak==0.1 from file:///builds/slave/test/build/tests/mozbase/mozleak in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 9)) 08:53:22 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 08:53:22 INFO - Running setup.py (path:/tmp/pip-3u7K6l-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 08:53:22 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog==3.0 from file:///builds/slave/test/build/tests/mozbase/mozlog in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 08:53:22 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 08:53:22 INFO - Running setup.py (path:/tmp/pip-SB7IM3-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 08:53:22 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork==0.27 from file:///builds/slave/test/build/tests/mozbase/moznetwork in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 11)) 08:53:22 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 08:53:22 INFO - Running setup.py (path:/tmp/pip-jeEWoj-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 08:53:22 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess==0.22 from file:///builds/slave/test/build/tests/mozbase/mozprocess in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 12)) 08:53:22 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 08:53:22 INFO - Running setup.py (path:/tmp/pip-DO9043-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 08:53:22 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile==0.27 from file:///builds/slave/test/build/tests/mozbase/mozprofile in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 13)) 08:53:22 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 08:53:22 INFO - Running setup.py (path:/tmp/pip-ZJBsXv-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 08:53:22 INFO - Requirement already satisfied (use --upgrade to upgrade): mozrunner==6.11 from file:///builds/slave/test/build/tests/mozbase/mozrunner in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 14)) 08:53:22 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 08:53:22 INFO - Running setup.py (path:/tmp/pip-xtx_Bc-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 08:53:22 INFO - Requirement already satisfied (use --upgrade to upgrade): mozscreenshot==0.1 from file:///builds/slave/test/build/tests/mozbase/mozscreenshot in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 15)) 08:53:22 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 08:53:22 INFO - Running setup.py (path:/tmp/pip-XaaGJI-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 08:53:22 INFO - Requirement already satisfied (use --upgrade to upgrade): moztest==0.7 from file:///builds/slave/test/build/tests/mozbase/moztest in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 16)) 08:53:22 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 08:53:22 INFO - Running setup.py (path:/tmp/pip-_0Tee4-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 08:53:22 INFO - Requirement already satisfied (use --upgrade to upgrade): mozversion==1.4 from file:///builds/slave/test/build/tests/mozbase/mozversion in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 17)) 08:53:22 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==0.16->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 08:53:22 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==0.16->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 08:53:22 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdebug==0.1->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 3)) 08:53:22 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdevice==0.47->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 08:53:22 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.19 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdevice==0.47->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 08:53:22 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.0->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 08:53: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 08:53: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 08:53: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 08:53: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 08:53: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 08:53: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 08:53:24 INFO - Downloading blessings-1.5.1.tar.gz 08:53:24 INFO - Storing download in cache at /builds/slave/test/build/venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fblessings-1.5.1.tar.gz 08:53:24 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 08:53:24 INFO - Installing collected packages: blessings 08:53:24 INFO - Running setup.py install for blessings 08:53:24 INFO - Successfully installed blessings 08:53:24 INFO - Cleaning up... 08:53:24 INFO - Return code: 0 08:53:24 INFO - Done creating virtualenv /builds/slave/test/build/venv. 08:53:24 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 08:53:24 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 08:53:24 INFO - Reading from file tmpfile_stdout 08:53:24 INFO - Current package versions: 08:53:24 INFO - argparse == 1.2.1 08:53:24 INFO - blessings == 1.5.1 08:53:24 INFO - blobuploader == 1.2.4 08:53:24 INFO - docopt == 0.6.1 08:53:24 INFO - manifestparser == 1.1 08:53:24 INFO - mozInstall == 1.12 08:53:24 INFO - mozcrash == 0.16 08:53:24 INFO - mozdebug == 0.1 08:53:24 INFO - mozdevice == 0.47 08:53:24 INFO - mozfile == 1.2 08:53:24 INFO - mozhttpd == 0.7 08:53:24 INFO - mozinfo == 0.9 08:53:24 INFO - mozleak == 0.1 08:53:24 INFO - mozlog == 3.0 08:53:24 INFO - moznetwork == 0.27 08:53:24 INFO - mozprocess == 0.22 08:53:24 INFO - mozprofile == 0.27 08:53:24 INFO - mozrunner == 6.11 08:53:24 INFO - mozscreenshot == 0.1 08:53:24 INFO - mozsystemmonitor == 0.0 08:53:24 INFO - moztest == 0.7 08:53:24 INFO - mozversion == 1.4 08:53:24 INFO - psutil == 3.1.1 08:53:24 INFO - requests == 1.2.3 08:53:24 INFO - wsgiref == 0.1.2 08:53:24 INFO - Installing None into virtualenv /builds/slave/test/build/venv 08:53:24 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 08:53:24 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:53:24 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:53:24 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 08:53:24 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:53:24 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:53:24 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '-r', '/builds/slave/test/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 0x7fb32803cc70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x215c6c0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x220d900>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2253b70>, '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 0x22a4dc0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x22a5250>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/talos', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '6e558709db315bacd2260379000001b6-1447951971.970899-241625982', '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', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 08:53:24 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '-r', '/builds/slave/test/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/build/tests/talos 08:53:24 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --download-cache /builds/slave/test/build/venv/cache --timeout 120 -r /builds/slave/test/build/tests/talos/requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 08:53:24 INFO - Using env: {'DISPLAY': ':0', 08:53:24 INFO - 'HOME': '/home/cltbld', 08:53:24 INFO - 'LANG': 'en_US.UTF-8', 08:53:24 INFO - 'LANGUAGE': 'en_US:en', 08:53:24 INFO - 'LOGNAME': 'cltbld', 08:53:24 INFO - 'MAIL': '/var/mail/cltbld', 08:53:24 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:53:24 INFO - 'MOZ_NO_REMOTE': '1', 08:53:24 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:53:24 INFO - 'NO_EM_RESTART': '1', 08:53:24 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:53:24 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:53:24 INFO - 'PWD': '/builds/slave/test', 08:53:24 INFO - 'SHELL': '/bin/bash', 08:53:24 INFO - 'SHLVL': '1', 08:53:24 INFO - 'TERM': 'linux', 08:53:24 INFO - 'TMOUT': '86400', 08:53:24 INFO - 'USER': 'cltbld', 08:53:24 INFO - 'XDG_SESSION_COOKIE': '6e558709db315bacd2260379000001b6-1447951971.970899-241625982', 08:53:24 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:53:24 INFO - '_': '/tools/buildbot/bin/python'} 08:53:24 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:53:24 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash>=0.15 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 08:53:24 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.2 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 2)) 08:53:24 INFO - Requirement already satisfied (use --upgrade to upgrade): mozhttpd>=0.7 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 3)) 08:53:24 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo>=0.8 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 4)) 08:53:24 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.22 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 5)) 08:53:24 INFO - Requirement already satisfied (use --upgrade to upgrade): mozversion>=1.3 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 6)) 08:53:24 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile>=0.25 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 7)) 08:53:24 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 8)) 08:53:24 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash>=0.15->-r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 08:53:24 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozhttpd>=0.7->-r /builds/slave/test/build/tests/talos/requirements.txt (line 3)) 08:53:24 INFO - Requirement already satisfied (use --upgrade to upgrade): blessings>=1.3 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozlog>=3.0->mozcrash>=0.15->-r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 08:53:24 INFO - Cleaning up... 08:53:24 INFO - Return code: 0 08:53:24 INFO - Running post-action listener: _resource_record_post_action 08:53:24 INFO - Running post-action listener: _start_resource_monitoring 08:53:24 INFO - Starting resource monitoring. 08:53:24 INFO - ##### 08:53:24 INFO - ##### Running install step. 08:53:24 INFO - ##### 08:53:24 INFO - Running pre-action listener: _resource_record_pre_action 08:53:24 INFO - Running main action method: install 08:53:24 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 08:53:24 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 08:53:25 INFO - Reading from file tmpfile_stdout 08:53:25 INFO - Detecting whether we're running mozinstall >=1.0... 08:53:25 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 08:53:25 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 08:53:25 INFO - Reading from file tmpfile_stdout 08:53:25 INFO - Output received: 08:53:25 INFO - Usage: mozinstall [options] installer 08:53:25 INFO - Options: 08:53:25 INFO - -h, --help show this help message and exit 08:53:25 INFO - -d DEST, --destination=DEST 08:53:25 INFO - Directory to install application into. [default: 08:53:25 INFO - "/builds/slave/test"] 08:53:25 INFO - --app=APP Application being installed. [default: firefox] 08:53:25 INFO - mkdir: /builds/slave/test/build/application 08:53:25 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2', '--destination', '/builds/slave/test/build/application'] 08:53:25 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2 --destination /builds/slave/test/build/application 08:53:39 INFO - Reading from file tmpfile_stdout 08:53:40 INFO - Output received: 08:53:40 INFO - /builds/slave/test/build/application/firefox/firefox 08:53:40 INFO - Running post-action listener: _resource_record_post_action 08:53:40 INFO - ##### 08:53:40 INFO - ##### Running run-tests step. 08:53:40 INFO - ##### 08:53:40 INFO - Running pre-action listener: _resource_record_pre_action 08:53:40 INFO - Running main action method: run_tests 08:53:40 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 08:53:40 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 08:53:40 INFO - Python 2.7.3 08:53:40 INFO - Return code: 0 08:53:40 INFO - grabbing minidump binary from tooltool 08:53:40 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 08:53:40 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/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 0x2253b70>, '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 0x22a4dc0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x22a5250>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 08:53:40 INFO - Running command: ['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'] in /builds/slave/test/build 08:53:40 INFO - Copy/paste: /tools/tooltool.py --url https://api.pub.build.mozilla.org/tooltool/ --authentication-file /builds/relengapi.tok fetch -m /builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest -o -c /builds/tooltool_cache 08:53:40 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 08:53:40 INFO - Return code: 0 08:53:40 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 08:53:40 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 08:53:40 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 08:53:40 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 08:53:40 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 08:53:40 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--debug', '--branchName', 'Fx-Team-Non-PGO', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/yCbnT5LETxK90Kq4qrGFyw/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-039', '--webServer', 'localhost'] in /builds/slave/test/build 08:53:40 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --debug --branchName Fx-Team-Non-PGO --suite dromaeojs --executablePath /builds/slave/test/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/yCbnT5LETxK90Kq4qrGFyw/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-039 --webServer localhost 08:53:40 INFO - Using env: {'DISPLAY': ':0', 08:53:40 INFO - 'HOME': '/home/cltbld', 08:53:40 INFO - 'LANG': 'en_US.UTF-8', 08:53:40 INFO - 'LANGUAGE': 'en_US:en', 08:53:40 INFO - 'LOGNAME': 'cltbld', 08:53:40 INFO - 'MAIL': '/var/mail/cltbld', 08:53:40 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 08:53:40 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 08:53:40 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:53:40 INFO - 'MOZ_NO_REMOTE': '1', 08:53:40 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 08:53:40 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:53:40 INFO - 'NO_EM_RESTART': '1', 08:53:40 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:53:40 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:53:40 INFO - 'PWD': '/builds/slave/test', 08:53:40 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 08:53:40 INFO - 'SHELL': '/bin/bash', 08:53:40 INFO - 'SHLVL': '1', 08:53:40 INFO - 'TERM': 'linux', 08:53:40 INFO - 'TMOUT': '86400', 08:53:40 INFO - 'USER': 'cltbld', 08:53:40 INFO - 'XDG_SESSION_COOKIE': '6e558709db315bacd2260379000001b6-1447951971.970899-241625982', 08:53:40 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:53:40 INFO - '_': '/tools/buildbot/bin/python'} 08:53:40 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--debug', '--branchName', 'Fx-Team-Non-PGO', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/yCbnT5LETxK90Kq4qrGFyw/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-039', '--webServer', 'localhost'] with output_timeout 3600 08:53:41 INFO - mozversion INFO | application_buildid: 20151119072803 08:53:41 INFO - mozversion INFO | application_changeset: d052d9447bf90d0fedaae937afb76e672ca6d49b 08:53:41 INFO - mozversion INFO | application_display_name: Nightly 08:53:41 INFO - mozversion INFO | application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 08:53:41 INFO - mozversion INFO | application_name: Firefox 08:53:41 INFO - mozversion INFO | application_remotingname: firefox 08:53:41 INFO - mozversion INFO | application_repository: https://hg.mozilla.org/integration/fx-team 08:53:41 INFO - mozversion INFO | application_vendor: Mozilla 08:53:41 INFO - mozversion INFO | application_version: 45.0a1 08:53:41 INFO - mozversion INFO | platform_buildid: 20151119072803 08:53:41 INFO - mozversion INFO | platform_changeset: d052d9447bf90d0fedaae937afb76e672ca6d49b 08:53:41 INFO - mozversion INFO | platform_repository: https://hg.mozilla.org/integration/fx-team 08:53:41 INFO - mozversion INFO | platform_version: 45.0a1 08:53:41 INFO - 2015-11-19 08:53:41,323 DEBUG : using testdate: 1447952021 08:53:41 INFO - 2015-11-19 08:53:41,323 DEBUG : actual date: 1447952021 08:53:41 INFO - 2015-11-19 08:53:41,332 INFO : starting webserver on 'localhost:59401' 08:53:41 INFO - 2015-11-19 08:53:41,333 INFO : Starting test suite talos-linux64-ix-039 08:53:41 INFO - 2015-11-19 08:53:41,333 INFO : Starting test dromaeo_css 08:53:41 INFO - 2015-11-19 08:53:41,333 DEBUG : operating with platform_type : linux_ 08:53:41 INFO - 2015-11-19 08:53:41,334 INFO : Initialising browser for dromaeo_css test... 08:53:41 INFO - 2015-11-19 08:53:41,350 DEBUG : command line: /builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpiE6jX9/profile http://localhost:59401/getInfo.html 08:53:45 INFO - 2015-11-19 08:53:45,852 DEBUG : BROWSER_OUTPUT: __metrics Screen width/height:1600/1200 08:53:45 INFO - 2015-11-19 08:53:45,852 DEBUG : BROWSER_OUTPUT: colorDepth:24 08:53:45 INFO - 2015-11-19 08:53:45,852 DEBUG : BROWSER_OUTPUT: Browser inner width/height: 1024/697 08:53:45 INFO - 2015-11-19 08:53:45,852 DEBUG : BROWSER_OUTPUT: __metrics 08:53:45 INFO - 2015-11-19 08:53:45,960 DEBUG : BROWSER_OUTPUT: JavaScript error: resource:///modules/WebappManager.jsm, line 48: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 08:53:47 INFO - 2015-11-19 08:53:47,320 INFO : Browser initialized. 08:53:47 INFO - 2015-11-19 08:53:47,321 INFO : Running cycle 1/1 for dromaeo_css test... 08:53:47 INFO - 2015-11-19 08:53:47,321 DEBUG : command line: /builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpiE6jX9/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1 08:53:59 INFO - 2015-11-19 08:53:59,287 DEBUG : BROWSER_OUTPUT: RSS: Main: 142008320 08:53:59 INFO - 2015-11-19 08:53:59,288 DEBUG : BROWSER_OUTPUT: 08:54:50 INFO - 2015-11-19 08:54:50,422 DEBUG : BROWSER_OUTPUT: 1447952090422 addons.productaddons ERROR Request failed certificate checks: [Exception... "SSL is required and URI scheme is not https." nsresult: "0x8000ffff (NS_ERROR_UNEXPECTED)" location: "JS frame :: resource://gre/modules/CertUtils.jsm :: checkCert :: line 145" data: no] 08:57:02 INFO - 2015-11-19 08:57:02,681 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:59401/tests/dromaeo/cssquery-dojo.html (next: http://localhost:59401/tests/dromaeo/cssquery-ext.html) 08:57:03 INFO - 2015-11-19 08:57:03,746 DEBUG : BROWSER_OUTPUT: RSS: Main: 234147840 08:57:03 INFO - 2015-11-19 08:57:03,746 DEBUG : BROWSER_OUTPUT: 09:00:06 INFO - 2015-11-19 09:00:06,261 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:59401/tests/dromaeo/cssquery-ext.html (next: http://localhost:59401/tests/dromaeo/cssquery-jquery.html) 09:00:06 INFO - 2015-11-19 09:00:06,843 DEBUG : BROWSER_OUTPUT: RSS: Main: 217296896 09:00:06 INFO - 2015-11-19 09:00:06,843 DEBUG : BROWSER_OUTPUT: 09:03:08 INFO - 2015-11-19 09:03:08,904 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:59401/tests/dromaeo/cssquery-jquery.html (next: http://localhost:59401/tests/dromaeo/cssquery-mootools.html) 09:03:09 INFO - 2015-11-19 09:03:09,473 DEBUG : BROWSER_OUTPUT: RSS: Main: 206331904 09:03:09 INFO - 2015-11-19 09:03:09,473 DEBUG : BROWSER_OUTPUT: 09:06:11 INFO - 2015-11-19 09:06:11,416 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:59401/tests/dromaeo/cssquery-mootools.html (next: http://localhost:59401/tests/dromaeo/cssquery-prototype.html) 09:06:12 INFO - 2015-11-19 09:06:12,018 DEBUG : BROWSER_OUTPUT: RSS: Main: 197378048 09:06:12 INFO - 2015-11-19 09:06:12,019 DEBUG : BROWSER_OUTPUT: 09:09:14 INFO - 2015-11-19 09:09:14,716 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:59401/tests/dromaeo/cssquery-prototype.html (next: http://localhost:59401/tests/dromaeo/cssquery-yui.html) 09:09:15 INFO - 2015-11-19 09:09:15,322 DEBUG : BROWSER_OUTPUT: RSS: Main: 205471744 09:09:15 INFO - 2015-11-19 09:09:15,322 DEBUG : BROWSER_OUTPUT: 09:12:17 INFO - 2015-11-19 09:12:17,675 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:59401/tests/dromaeo/cssquery-yui.html (next: http://localhost:59401/tests/dromaeo/cssquery-dojo.html) 09:12:17 INFO - 2015-11-19 09:12:17,925 DEBUG : BROWSER_OUTPUT: RSS: Main: 245858304 09:12:17 INFO - 2015-11-19 09:12:17,925 DEBUG : BROWSER_OUTPUT: 09:12:17 INFO - 2015-11-19 09:12:17,927 DEBUG : BROWSER_OUTPUT: __start_tp_report 09:12:17 INFO - 2015-11-19 09:12:17,927 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load 09:12:17 INFO - 2015-11-19 09:12:17,927 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load_details 09:12:17 INFO - 2015-11-19 09:12:17,927 DEBUG : BROWSER_OUTPUT: |i|pagename|runs| 09:12:17 INFO - 2015-11-19 09:12:17,928 DEBUG : BROWSER_OUTPUT: |0;dojo.html;2597.7142514323423;2712.64735584374;2731.426400455904;2743.3827388837503;2749.024096445761;4603.079384123172;4714.292856071591;4768.30859525369;4818.927716084258;4859.659823812334;4672.556107169813;4675.251959686451;4729;4754.6434017448655;4758;4355.150745604608;4357.956420435787;4454.0423808881005;4516.954830451687;4565;4230.851920182794;4454.97772511137;4487.528809475007;4526.311607302494;4586.8394606188795;4302.827886884521;4338.891527711801;4455.997400584875;4458.996725736716;4503.729776213438;4414.757188354639;4430.778461076933;4438.312061630452;4449.065696203801;4460.442444694413;4398.626116780046;4402.933955990663;4410.845620403303;4440.600345968846;4454.220511410523;4537.228671125917;4642.280446530793;4659.114768194032;4660.4174478190225;4762.857114286577;5106.9489305106845;5133.30700355451;5135.12702840518;5138.46046165151;5139.537441630234;5155.329807125087;5159.097157997336;5162.22566615007;5198.090334191539;5216.608754343401;4626.653001024903;4629.051044535862;4711.976440117777;4744.288356746447;4750.168720473903;5277.577793776489;5349.304590403301;5356.143017117242;5359.14253719403;5399.757010934517;5104.948950510522;5136.383633963948;5137.255098010843;5137.743112844343;5181.663191892515;4941.703497790144;5074.340335756402;5075.543201111917;5135.87160320995;5277.472252774692;5159.045576568347;5161.096808058574;5161.509656582619;5192.350956130484;5201.817936372209;5124.666896651705;5125.103106956342;5139.254808052811;5143.382794064736;5177.741112944338;4137.069159439162;4242.703010789215;4244.511881133647;4329.28566786483;4410.140022695544;3744.756590821588;3814.9618503815163;3820.503334566489;3851.287511810324;3862.343401621731;4363.890902727394;4400.4939431965095;4401.889952751207;4413.801378937891;4442.53353397895;4878.243872199815;5012.147934851084;5014.147594908874;5119.974400127976;5187.351581052369;4299.613034826881;4362.454693163355;4375.037491751809;4392.121575684812;4419.270820314612;4632.2125238709505;4634.165850147006;4639.443266808004;4643.605293550086;4657.161710892072;4644.256918893096;4918.163912135017;4922.852314430573;4923.187674033744;4935.161022626162;5037.370328708911;5090.618203634668;5105.744712764421;5149.665271757323;5182.300389447376;4856.902861942812;4871.415430148405;4875.293082503088;4894.877628059185;4915.410150781929;5045.394552653705;5050.671706339076;5058.519440653132;5063.468335824686;5089.898202036013;4907.68100073494;4983.950160498349;5042.949570504248;5138.049460849755;5307.734613269398;4885.267209918541;4887.242477415864;4890.6332025097545;4916.115099282163;4938.234573641092;4866.878328041827;4888.608911287018;4898.142825005681;4920.827771027997;4956.033573453142;4633.096546173599;4715.882102947454;4748.952510474851;4752.952470475251;4847.757612119451;4910.8281210157475;4930.433000204879;4934.432540257916;4945.505449455026;4981.128302547112;4813.109574728686;4821.493743156918;4823.855284341475;4833.081714474239;4884.413870335582 09:12:17 INFO - 2015-11-19 09:12:17,930 DEBUG : BROWSER_OUTPUT: |1;ext.html;540.8458589302049;551.0824477245386;553.706535536166;560.5739637875215;562.3813804814704;28321.150365489044;37378.43932341017;38061;38214;38230.42654360187;40660;41157.38263926043;41189;41194;41209;7001.544899581511;7070.9292907070785;7733.806654833618;7872.3308518775975;7886.250806173404;10311.175105991502;10631.734206644818;10635.627753028646;10635.893641063607;10640.733981650443;10301.79396412075;10417.062464378205;10423.739406514822;10424.843627345595;10425.478726063704;7189.209186989427;7394.630268486554;10310.226732995055;10353.637622683245;10668.893311066868;10033.749156271151;10225.795484090351;10226.744331391701;10232.488375581266;10236.795264094751;37714;38322;38405;38454.23091538154;38570.228595427936;3007.248187953012;3064.6628870824193;3095.90712278632;3549.201429678302;3662.432322989914;27967.86016069927;28330.2917427066;28821.85589072062;29110.27224319388;29271.268218294714;2920.897768578111;2964.4960356739407;2985.373071654955;2997.925051873699;3058.5565093061605;228719;229701;229886;229975;230638.84680576657;52911.73544132332;53996.73001634967;57022.7148864253;57028.144577831365;58536;51985.220221696705;52101.7394913023;52198.739006305485;52285.73857130766;52397.73801131046;13795.517156899461;13917.095388799695;13945;13987.23070231147;13989.580312590639;10394.376337419779;10466.267361284788;10484.842727359095;10494.108000820015;10566.947165264279;19550.21799128019;19585.216591336186;19690.50773730668;19742.11160497781;19855.60288794245;7439.293267139613;7609.961950190324;7676.731314403969;7684.346830519356;7698.191689872595;891.8662200669821;927.9164875161268;1067.0449947297282;1071.689210129054;1086;26145;26440.867795661285;27167.320816979733;27288.72711272862;27609.171724848286;949.1173208915775;974.0746291023556;990.4156547636928;992.156666833186;1058.5183741397645;14113.85886141146;14489.855101448851;14507.637309067357;14776.92611536957;14782.926085369505;267494;268260;269559;270077.9488307677;270844;45937.77031114823;46092.769536152104;46132.30801537979;46154.307685384745;46171.538284617396;1040.443362800913;1243;1254.9874501254872;1259.571745606498;1275.9808602870964;20997.580048399253;26486.072987445346;27221.72778272192;27399.589006165323;27569.862150689118;44221.778891105336;44240;44526;44607;44646.77676611596;243389;252203;255539;305713;309143;26540.601890972037;26649.733502664723;26699.33251668724;26897.462050759266;26995.59506607363;37428.2514349706;37939.620603793606;38527.807360963016;40269.59730402775;42301.576984231;30862.456877155604;31424;32208;32695;32899.67100328966;32066.839665801523;32434.513482298258;32566.185845354055;32613.510797338535;32839;31171.064868053996;32139;32200;32359.191020224684;32378.514322285657;28401.43197136087;29032.274193145342;29123.090897358867;30026;31382;22586.322410327717;23089.88455057714;23106.38676920347;23372;23490.295291141294 09:12:17 INFO - 2015-11-19 09:12:17,931 DEBUG : BROWSER_OUTPUT: |2;jquery.html;322.33759623972725;336.5859992209583;338.31153602419084;342.99502457798656;343.0377790298213;11969.581064662738;12413.937930310336;14888.404463821447;15317.84682153178;15367.923160384196;13032.674183145426;14380.856191438083;14543;14565.198914059722;14595.41618335268;3630.52803135592;4864.027194561084;4904.435989861176;5048.394192696882;5049;3599.1362073102396;3705.851186132294;3711.1464363196483;3713.4244192150127;5013.448520662724;3689.151495156102;3689.778613283198;5612.971935140318;5758.539316854642;5809.721861190553;5633.6619802811965;5738.4835364816945;5740.598158128891;5743.253377060976;5826.650400975955;5004;5014.047331007097;5025.974870125662;5029.069622119883;5029.170186919154;18289.268429262815;18765.249390024383;18990.52523686905;19019.239230430765;19233;1874.390822982536;1904.7619047619048;1919.64486569985;1957.2855907593769;1987.3640435060786;12267.325297108655;12307;12416.875831241752;12444.688882777913;12697.174683645533;1784.4379020608467;1801.5586181385513;1809.1406581873637;1843.0784607696153;1843.8880998451093;53569.46430535723;54642.45357546413;55176.72411637956;55529.44470555283;55825;6162.537809664203;6230.875382492415;6258.280297765724;6263.4362907338555;6316.557840951181;7295.671694773748;7297.270272972766;7301.744438944612;7305.963470182722;7316.451266154953;4916.287138364917;4929.778159982738;4971.676841005323;4971.776270067856;4972.577330926912;5085.491450854959;5088.0587091388215;5130.897382052338;5135.229715542624;5135.948640513547;2848.9145325640266;2890.421915616885;2899.260688524455;2913.9417211656073;2926.9707302927122;980.6959842448721;1026.5175367577226;1028.4600584693096;1077.159815344033;1081.5241293830688;383.8522168964969;389.0274314214464;399.1458279282338;412.27028160156357;416.4939598387913;10102.242331824995;10244.385336879812;10305;10403.94798026005;10497.9475102624;390.8241291418873;402.87712247764125;413.24788884231015;416.6333626408741;442.52649664858933;5608.691521966331;5682.204491371212;5764.221830052889;5843.795467158629;5978.880422391528;443990.6802795921;444523;448206;470966;477339;59091.70454147702;59996.40003599908;60340;61550.38449615536;64817.67591162014;468.67427138139345;479.99520004800206;481.1819906159543;481.4703825791601;481.98072077117223;9999.500024998575;10059.647912323033;10063.597456101674;10152.847707284249;10177.440240786827;30014.24964375908;30062.699373006864;30270.243243919078;30278.394432111676;31282.843585781924;36810.81594592117;36990.63009369872;38494.615053849106;38978.80510597429;39203;5595.804146854841;5674.404187560247;5677.5457963362005;5682.176084467646;5692.430756924275;10339.379637221791;10454.372737635766;10929.453527323443;10936.945315273373;10948.726281843017;9464.195543378615;9469.384490008128;9728.319017668695;9801.411915285105;9807.21542276602;9555.808883822423;9581.425114493153;9614.375065620712;9798.951005244928;9819.801980198019;9555.61777528891;9893.25800564946;9920;9979.550920208752;9996.100350968447;5737.856553586027;5828.446297601721;5879.088741245114;5900.262467191601;5901.940980590139;9687.70936871895;9759.414435133915;9979.850302245617;10200.795984080129;10210.948945255226 09:12:17 INFO - 2015-11-19 09:12:17,935 DEBUG : BROWSER_OUTPUT: |3;mootools.html;1433.0685054714427;1536.9615759606008;1537.7155226283132;1605.9839401605982;1665.4254282272616;5857.7364018619155;6758.594484330937;6863.828404289889;6877.896831547519;6897.206821215562;6957.686904089315;6977.89533157003;6985.790426287207;7007.544509606884;7008.96495517523;1684.679910816947;1719.6818588561093;2038.5413282011577;2052.179128348665;2054.7637021742466;2091.5816836632657;2133.381319417367;2138.0592539282743;2139.326112274636;2139.81811546018;2069.492974221318;2082.9895850520725;2114.2811444109075;2124.4157856589486;2127.117246342766;1590.379751896767;1619.757036444531;1625.6261059956275;1888.0276657521388;1956.1392987085637;2094.7695753467106;2104.968425473619;2108.620448319302;2109.69409435631;2110.556783075541;6920.273371295992;7039.260877607829;7039.648017599099;7044.295570442966;7071.717131314741;4264.552222016706;4299.097189590189;4315.784210789448;4330;4336.3278691802825;2633.4469761350138;2708.1604702542077;2723.904663336774;2742.657167854018;2743.6158937748733;819.2258315891485;843.1863251961886;845.0915266088979;863.0290922711949;870.1124852650262;9502.619895204183;9541.141297283279;9557.856632150453;9560.713178604654;9574.904250957541;3852;3900.5904380039688;3975.920481590352;4030.435738996543;4031.576684448091;7941.324987376022;7962.681492740341;7962.960185199037;7969.442139050327;7980.441369104107;4357.782110894506;4358.193734159191;4371.147626212922;4373.037931655031;4373.781310934441;3933.1150491139265;3933.193695292458;3933.842646294116;3934.232824599233;3935.842566297373;3314.436545787222;3403.4724617684296;3424.503447000221;3424.70889974355;3432.3993301172195;1153.5385845661635;1161;1161.0015386767373;1161.9477123529462;1173.906087512997;1016.9491525423699;1157.2651366382408;1170.3855475875234;1190.6249531397582;1191.4697959407981;6590.044443555754;6635.668216589248;6671;6678.298778628271;6733.057371967929;417.8433087592153;427.8374217797217;429.0239704671834;430.4791202644772;430.72003197920975;4844.515548445127;4926.75366231687;5079.4412614612365;5164.509371609691;5403.891922161535;7942.960285198537;8138.198462906913;8161.306288965505;8205.466644668077;8223.917760822314;8296.626651800683;8936.776580585407;9028.277737780962;9067.727968160965;9079.319051071196;6609.801705948829;6643.833904152435;6663.267040625527;6682.498812589075;6715.127033485714;6356.745730170742;6401.263854656774;6474.741010359721;6512.479001679949;6516.218053833571;7418.072740907387;7499.362554182738;7511.774646760606;7528.284812942762;7650;7442.255774422514;7689.269519395649;7699.461037727306;7705.460617756703;7730.884036739566;5986.281646202484;6039.48664363534;6041.9395806041375;6042.456178943916;6057.1519987200945;6595.472362210916;6781.2879647638265;6823.420009299265;6836.760713375008;6845.247022827385;6421;6449.419552240321;6500.577462464925;6522.869542609026;6552.901706474502;6026.487748541423;6307.716152773044;6316.842078948063;6432.3567643237175;6467.805965821033;6394.4884409246215;6441.645709486023;6446.548741588043;6459.386358295955;6467.644279564669;5948.910766338595;6013.278406591237;6017.007193812972;6022.1870047543025;6030.3668114847305;5863.442972917566;5902.940970590411;5920.437558431942;5926.881462370815;5932.317783454785 09:12:17 INFO - 2015-11-19 09:12:17,935 DEBUG : BROWSER_OUTPUT: |4;prototype.html;311.9906402807916;315.44481712186547;321.5193286037374;323.9740820734344;324.63154319846967;5360.169173778061;5498.80754173604;5504.944950550498;5564.944350556499;5569.053260945644;5321.574274058075;5480.123180291154;5480.616356855022;5482.91775623366;5488.670679759217;4052.7365721228175;4192.5807419258135;4220.873373798791;4278.657707383418;4284.871453856374;4139.399787030894;4202.3696445533105;4219.915601687964;4220.831166753342;4232.195882782277;4197.895052623679;4229.365595160735;4229.492460904696;4232.703710740249;4238.851640192594;4230.217409779185;4237.385579091046;4238.109996900639;4243.957560424387;4244.617984381421;3719.479272901796;3724.2737666155112;3725.5343082114737;3725.739198256123;3728.9067773305615;5186.092433824066;5223.320968274138;5280.762365693553;5285.365756109253;5300.867478313035;4853.466118726938;4857.368542089541;4857.465678775332;4863.829765958175;4865.562099411035;5446.101393270105;5655.688937108457;5763.4812866842185;5769.423057694239;5773.047447171211;3924.489816323888;3975.8807235782974;3976.602339766029;4017.5580686124504;4020.336644453662;6061.060535616986;6078.300995385543;6078.39216078393;6082.60463069899;6090.086487026937;4160.563140870226;4164.021454958082;4164.83340666376;4165.812538435777;4166.854160104382;4007.719459637797;4173.603507666767;4225.809838557272;4229.873103806891;4237.427947227146;4774.928376074362;4790.161721698689;4791.6645834791925;4793.808247670124;4801.087793319258;5772.451617096369;5778.104393818965;5785.190073389729;5787.565932555075;5788.363280039192;1447.9131252124696;1458.4676593043462;1458.5624312706145;1460.0582624207539;1460.4377314733904;962.3263715399248;973.8636590877283;982.6413359123868;991.4348821171862;993.8906720260766;5045.596352291808;5065.164247899055;5080.796768129308;5099.821506247264;5103.540681338697;5997.790077347359;6009.669468179292;6010.158577799111;6018.668973206428;6021.6989150542295;5095.363079615048;5100.464451232641;5100.897982040338;5103.77033033507;5105.15764898795;3164.810111393324;3214.8231847248157;3240.303334782986;3250.8537115829845;3255;5690.174924635905;5692.174634677948;5697.202391665171;5703.62926409782;5704.201411802351;6184.226971628546;6184.6598437085495;6185.072239164071;6186.628802271878;6191.473724733358;5532.557395408277;5688.601797874192;5690.9146362804595;5692.943070569324;5698.544116470673;5765.971170144123;5952.672603006703;5976.252968378953;5982.132590774227;5987.5808693391045;5764.538836892954;5895.616784908967;5896.8820623586425;5902.409759024235;5943.613665111754;5725.4560816724015;5727.255456790591;5729.598928074995;5732.684702341411;5737.368889422244;4150.875473735793;4155.501339839238;4157.251694694984;4157.8960525987095;4160.1679664067915;5927.585069045125;6022.819315420545;6050.788222412194;6055.394460553909;6062.666553339609;5818.359980402068;5821.185034095315;5824.737886795189;5825.533957283492;5828.59199856006;5801.3908539602735;5808.15781711641;5810.331811841692;5814.389489103583;5830.708464576839;5580.720963951705;5689.317281926195;5689.800856969986;5696.572757043155;5698.401667824819;5840.065589505659;5849.327327357239;5856.267966504187;5858.062709966385;5861.9413805861395;5692.373838877637;5692.8576785579035;5696.287964004499;5697.088465845611;5698.401667824819 09:12:17 INFO - 2015-11-19 09:12:17,938 DEBUG : BROWSER_OUTPUT: |5;yui.html;665.720397433078;733.6515155301231;737.469022303941;752.3717695724071;815.9347252219823;10953.616623418182;11184.32894026357;11206.607768728096;11207.439628018597;11224.4948977296;11325.320480771159;11431.42842857858;11459.36973466459;11721.296722196674;12451.377431128452;793.2186796005944;804.9919500805005;805.2752522729531;805.569020573993;808.3573559020564;791.4459878085363;794.5550491724624;798.3453568074182;798.8042929482285;799.884016817564;829.784256093414;839.0812060793421;839.7900524868783;840.2353857989231;840.9495430274203;838.1618381618382;838.6310023589601;839.236294971573;839.5466448118009;839.9076101628816;619.8047615001306;620.1968450856107;620.4540004795796;620.6059152438235;620.981370558884;10910.5090270938;11024.173187011007;11046.944765276123;11047.668569942914;11057.668269951833;9597.712068637882;9985.251106166994;10050.396976181453;10057.798844023151;10245.53895074716;9923.553440095213;10138.138258248058;10174.236932230038;10401.635942742043;10429.061384475357;2880.9279768005968;2901.2891841498968;2924.400497897926;2955.069153216751;2956.408718256357;31858.681413185805;31968.20079498008;35043;35152.296954060774;36184.27631447383;6447.838804029937;6476.158099447041;6524.412802847766;6538.476921846241;6690.866182676319;10850.565977360975;10850.67447976562;10864.72838179036;10866.130709543218;10885.23803333759;4643.257078867365;5879.764809407661;6041.093835924647;6049.304330002106;6127.938720612826;3532.7350448716447;3533.7349698772696;3666.871659491905;3672.6143754905884;3685.6314368563467;2487.403023274437;2495.4510007798253;2502.574562324373;2507.1851648214038;2511.8947663028207;382.20882772660326;393.683085116484;397.16198820488745;397.7295439101381;401.3277759752403;458.23017330883766;534.7540131539536;549.126888247688;556.9415211402744;617.5491890919653;7719.421043421766;8218.958905205436;8239.134890836496;8361.540115293717;8534.78663033429;492.1510394569339;621.9937800622026;624.6658037949675;629.2826178156905;629.7197747002632;3571.321448924696;3695.371786796251;3814.237152569497;3870.9419358709642;3896.4350169225304;48842;49348.83139607549;49376.25935610969;49644.25533616998;49655;44368;45081.32378014332;45182.09635807265;45280.3207951881;45413.54586454093;41892.58107418887;42307.36538951918;42318.78840605839;42435.363469547985;42623.36064959028;7744.1094274159195;7822.960885195537;7874.881876771968;7913.433162094108;7926.167752386147;27117.72882271152;31445.68554314519;32319.51520727144;32555.837220813744;32589.674103258665;36726.44910326294;37291.62708372882;37407.43888841615;37474.625253747115;37608.43587346137;5606.831795046155;6403.583767055126;6808.557443766139;6850.554713943578;6997.475189360716;11750.353730544903;11805.76388472243;11849.703757406134;11879.524819007489;11906.166568340133;10592.364458132228;10620.044196022394;10838.620648277272;10877.891221087688;11644.068474521848;10115;10356.223283253938;10457.633982810565;10467.476626168813;10530;9627.855582166134;10318.329308594917;10335.689929302132;10568.365898046142;10760.246782725135;8902.465852048897;9262.72211833646;9542.666006689733;9558.139767420966;9582.66460673873;9006.602790051187;9185.908140918506;9216.124468175512;9256.213221876216;9335.159835614828 09:12:17 INFO - 2015-11-19 09:12:17,938 DEBUG : BROWSER_OUTPUT: __end_tp_report 09:12:17 INFO - 2015-11-19 09:12:17,939 DEBUG : BROWSER_OUTPUT: __start_cc_report 09:12:17 INFO - 2015-11-19 09:12:17,939 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_cycle_collect,901 09:12:17 INFO - 2015-11-19 09:12:17,939 DEBUG : BROWSER_OUTPUT: __end_cc_report 09:12:17 INFO - 2015-11-19 09:12:17,939 DEBUG : BROWSER_OUTPUT: __startTimestamp1447953137926__endTimestamp 09:12:17 INFO - 2015-11-19 09:12:17,939 DEBUG : BROWSER_OUTPUT: 09:12:17 INFO - 2015-11-19 09:12:17,939 DEBUG : BROWSER_OUTPUT: ------- Summary: start ------- 09:12:17 INFO - 2015-11-19 09:12:17,939 DEBUG : BROWSER_OUTPUT: Number of tests: 6 09:12:17 INFO - 2015-11-19 09:12:17,939 DEBUG : BROWSER_OUTPUT: 09:12:17 INFO - 2015-11-19 09:12:17,939 DEBUG : BROWSER_OUTPUT: [#0] dojo.html Cycles:165 Average:4721.02 Median:4833.08 stddev:493.75 (10.2%) stddev-sans-first:466.33 09:12:17 INFO - 2015-11-19 09:12:17,939 DEBUG : BROWSER_OUTPUT: Values: 2597.7 2712.6 2731.4 2743.4 2749.0 4603.1 4714.3 4768.3 4818.9 4859.7 4672.6 4675.3 4729.0 4754.6 4758.0 4355.2 4358.0 4454.0 4517.0 4565.0 4230.9 4455.0 4487.5 4526.3 4586.8 4302.8 4338.9 4456.0 4459.0 4503.7 4414.8 4430.8 4438.3 4449.1 4460.4 4398.6 4402.9 4410.8 4440.6 4454.2 4537.2 4642.3 4659.1 4660.4 4762.9 5106.9 5133.3 5135.1 5138.5 5139.5 5155.3 5159.1 5162.2 5198.1 5216.6 4626.7 4629.1 4712.0 4744.3 4750.2 5277.6 5349.3 5356.1 5359.1 5399.8 5104.9 5136.4 5137.3 5137.7 5181.7 4941.7 5074.3 5075.5 5135.9 5277.5 5159.0 5161.1 5161.5 5192.4 5201.8 5124.7 5125.1 5139.3 5143.4 5177.7 4137.1 4242.7 4244.5 4329.3 4410.1 3744.8 3815.0 3820.5 3851.3 3862.3 4363.9 4400.5 4401.9 4413.8 4442.5 4878.2 5012.1 5014.1 5120.0 5187.4 4299.6 4362.5 4375.0 4392.1 4419.3 4632.2 4634.2 4639.4 4643.6 4657.2 4644.3 4918.2 4922.9 4923.2 4935.2 5037.4 5090.6 5105.7 5149.7 5182.3 4856.9 4871.4 4875.3 4894.9 4915.4 5045.4 5050.7 5058.5 5063.5 5089.9 4907.7 4984.0 5042.9 5138.0 5307.7 4885.3 4887.2 4890.6 4916.1 4938.2 4866.9 4888.6 4898.1 4920.8 4956.0 4633.1 4715.9 4749.0 4753.0 4847.8 4910.8 4930.4 4934.4 4945.5 4981.1 4813.1 4821.5 4823.9 4833.1 4884.4 09:12:17 INFO - 2015-11-19 09:12:17,939 DEBUG : BROWSER_OUTPUT: 09:12:17 INFO - 2015-11-19 09:12:17,939 DEBUG : BROWSER_OUTPUT: [#1] ext.html Cycles:180 Average:41870.26 Median:2974.93 stddev:67374.05 (2264.7%) stddev-sans-first:67491.59 09:12:17 INFO - 2015-11-19 09:12:17,939 DEBUG : BROWSER_OUTPUT: Values: 540.8 551.1 553.7 560.6 562.4 28321.2 37378.4 38061.0 38214.0 38230.4 40660.0 41157.4 41189.0 41194.0 41209.0 7001.5 7070.9 7733.8 7872.3 7886.3 10311.2 10631.7 10635.6 10635.9 10640.7 10301.8 10417.1 10423.7 10424.8 10425.5 7189.2 7394.6 10310.2 10353.6 10668.9 10033.7 10225.8 10226.7 10232.5 10236.8 37714.0 38322.0 38405.0 38454.2 38570.2 3007.2 3064.7 3095.9 3549.2 3662.4 27967.9 28330.3 28821.9 29110.3 29271.3 2920.9 2964.5 2985.4 2997.9 3058.6 228719.0 229701.0 229886.0 229975.0 230638.8 52911.7 53996.7 57022.7 57028.1 58536.0 51985.2 52101.7 52198.7 52285.7 52397.7 13795.5 13917.1 13945.0 13987.2 13989.6 10394.4 10466.3 10484.8 10494.1 10566.9 19550.2 19585.2 19690.5 19742.1 19855.6 7439.3 7610.0 7676.7 7684.3 7698.2 891.9 927.9 1067.0 1071.7 1086.0 26145.0 26440.9 27167.3 27288.7 27609.2 949.1 974.1 990.4 992.2 1058.5 14113.9 14489.9 14507.6 14776.9 14782.9 267494.0 268260.0 269559.0 270077.9 270844.0 45937.8 46092.8 46132.3 46154.3 46171.5 1040.4 1243.0 1255.0 1259.6 1276.0 20997.6 26486.1 27221.7 27399.6 27569.9 44221.8 44240.0 44526.0 44607.0 44646.8 243389.0 252203.0 255539.0 305713.0 309143.0 26540.6 26649.7 26699.3 26897.5 26995.6 37428.3 37939.6 38527.8 40269.6 42301.6 30862.5 31424.0 32208.0 32695.0 32899.7 32066.8 32434.5 32566.2 32613.5 32839.0 31171.1 32139.0 32200.0 32359.2 32378.5 28401.4 29032.3 29123.1 30026.0 31382.0 22586.3 23089.9 23106.4 23372.0 23490.3 09:12:17 INFO - 2015-11-19 09:12:17,940 DEBUG : BROWSER_OUTPUT: 09:12:17 INFO - 2015-11-19 09:12:17,940 DEBUG : BROWSER_OUTPUT: [#2] jquery.html Cycles:180 Average:23497.54 Median:235717.34 stddev:74802.89 (31.7%) stddev-sans-first:74992.49 09:12:17 INFO - 2015-11-19 09:12:17,940 DEBUG : BROWSER_OUTPUT: Values: 322.3 336.6 338.3 343.0 343.0 11969.6 12413.9 14888.4 15317.8 15367.9 13032.7 14380.9 14543.0 14565.2 14595.4 3630.5 4864.0 4904.4 5048.4 5049.0 3599.1 3705.9 3711.1 3713.4 5013.4 3689.2 3689.8 5613.0 5758.5 5809.7 5633.7 5738.5 5740.6 5743.3 5826.7 5004.0 5014.0 5026.0 5029.1 5029.2 18289.3 18765.2 18990.5 19019.2 19233.0 1874.4 1904.8 1919.6 1957.3 1987.4 12267.3 12307.0 12416.9 12444.7 12697.2 1784.4 1801.6 1809.1 1843.1 1843.9 53569.5 54642.5 55176.7 55529.4 55825.0 6162.5 6230.9 6258.3 6263.4 6316.6 7295.7 7297.3 7301.7 7306.0 7316.5 4916.3 4929.8 4971.7 4971.8 4972.6 5085.5 5088.1 5130.9 5135.2 5135.9 2848.9 2890.4 2899.3 2913.9 2927.0 980.7 1026.5 1028.5 1077.2 1081.5 383.9 389.0 399.1 412.3 416.5 10102.2 10244.4 10305.0 10403.9 10497.9 390.8 402.9 413.2 416.6 442.5 5608.7 5682.2 5764.2 5843.8 5978.9 443990.7 444523.0 448206.0 470966.0 477339.0 59091.7 59996.4 60340.0 61550.4 64817.7 468.7 480.0 481.2 481.5 482.0 9999.5 10059.6 10063.6 10152.8 10177.4 30014.2 30062.7 30270.2 30278.4 31282.8 36810.8 36990.6 38494.6 38978.8 39203.0 5595.8 5674.4 5677.5 5682.2 5692.4 10339.4 10454.4 10929.5 10936.9 10948.7 9464.2 9469.4 9728.3 9801.4 9807.2 9555.8 9581.4 9614.4 9799.0 9819.8 9555.6 9893.3 9920.0 9979.6 9996.1 5737.9 5828.4 5879.1 5900.3 5901.9 9687.7 9759.4 9979.9 10200.8 10210.9 09:12:17 INFO - 2015-11-19 09:12:17,940 DEBUG : BROWSER_OUTPUT: 09:12:17 INFO - 2015-11-19 09:12:17,940 DEBUG : BROWSER_OUTPUT: [#3] mootools.html Cycles:180 Average:4916.45 Median:6024.34 stddev:2557.38 (42.5%) stddev-sans-first:2551.15 09:12:17 INFO - 2015-11-19 09:12:17,941 DEBUG : BROWSER_OUTPUT: Values: 1433.1 1537.0 1537.7 1606.0 1665.4 5857.7 6758.6 6863.8 6877.9 6897.2 6957.7 6977.9 6985.8 7007.5 7009.0 1684.7 1719.7 2038.5 2052.2 2054.8 2091.6 2133.4 2138.1 2139.3 2139.8 2069.5 2083.0 2114.3 2124.4 2127.1 1590.4 1619.8 1625.6 1888.0 1956.1 2094.8 2105.0 2108.6 2109.7 2110.6 6920.3 7039.3 7039.6 7044.3 7071.7 4264.6 4299.1 4315.8 4330.0 4336.3 2633.4 2708.2 2723.9 2742.7 2743.6 819.2 843.2 845.1 863.0 870.1 9502.6 9541.1 9557.9 9560.7 9574.9 3852.0 3900.6 3975.9 4030.4 4031.6 7941.3 7962.7 7963.0 7969.4 7980.4 4357.8 4358.2 4371.1 4373.0 4373.8 3933.1 3933.2 3933.8 3934.2 3935.8 3314.4 3403.5 3424.5 3424.7 3432.4 1153.5 1161.0 1161.0 1161.9 1173.9 1016.9 1157.3 1170.4 1190.6 1191.5 6590.0 6635.7 6671.0 6678.3 6733.1 417.8 427.8 429.0 430.5 430.7 4844.5 4926.8 5079.4 5164.5 5403.9 7943.0 8138.2 8161.3 8205.5 8223.9 8296.6 8936.8 9028.3 9067.7 9079.3 6609.8 6643.8 6663.3 6682.5 6715.1 6356.7 6401.3 6474.7 6512.5 6516.2 7418.1 7499.4 7511.8 7528.3 7650.0 7442.3 7689.3 7699.5 7705.5 7730.9 5986.3 6039.5 6041.9 6042.5 6057.2 6595.5 6781.3 6823.4 6836.8 6845.2 6421.0 6449.4 6500.6 6522.9 6552.9 6026.5 6307.7 6316.8 6432.4 6467.8 6394.5 6441.6 6446.5 6459.4 6467.6 5948.9 6013.3 6017.0 6022.2 6030.4 5863.4 5902.9 5920.4 5926.9 5932.3 09:12:17 INFO - 2015-11-19 09:12:17,941 DEBUG : BROWSER_OUTPUT: 09:12:17 INFO - 2015-11-19 09:12:17,941 DEBUG : BROWSER_OUTPUT: [#4] prototype.html Cycles:180 Average:4794.92 Median:5485.79 stddev:1417.48 (25.8%) stddev-sans-first:1380.94 09:12:17 INFO - 2015-11-19 09:12:17,941 DEBUG : BROWSER_OUTPUT: Values: 312.0 315.4 321.5 324.0 324.6 5360.2 5498.8 5504.9 5564.9 5569.1 5321.6 5480.1 5480.6 5482.9 5488.7 4052.7 4192.6 4220.9 4278.7 4284.9 4139.4 4202.4 4219.9 4220.8 4232.2 4197.9 4229.4 4229.5 4232.7 4238.9 4230.2 4237.4 4238.1 4244.0 4244.6 3719.5 3724.3 3725.5 3725.7 3728.9 5186.1 5223.3 5280.8 5285.4 5300.9 4853.5 4857.4 4857.5 4863.8 4865.6 5446.1 5655.7 5763.5 5769.4 5773.0 3924.5 3975.9 3976.6 4017.6 4020.3 6061.1 6078.3 6078.4 6082.6 6090.1 4160.6 4164.0 4164.8 4165.8 4166.9 4007.7 4173.6 4225.8 4229.9 4237.4 4774.9 4790.2 4791.7 4793.8 4801.1 5772.5 5778.1 5785.2 5787.6 5788.4 1447.9 1458.5 1458.6 1460.1 1460.4 962.3 973.9 982.6 991.4 993.9 5045.6 5065.2 5080.8 5099.8 5103.5 5997.8 6009.7 6010.2 6018.7 6021.7 5095.4 5100.5 5100.9 5103.8 5105.2 3164.8 3214.8 3240.3 3250.9 3255.0 5690.2 5692.2 5697.2 5703.6 5704.2 6184.2 6184.7 6185.1 6186.6 6191.5 5532.6 5688.6 5690.9 5692.9 5698.5 5766.0 5952.7 5976.3 5982.1 5987.6 5764.5 5895.6 5896.9 5902.4 5943.6 5725.5 5727.3 5729.6 5732.7 5737.4 4150.9 4155.5 4157.3 4157.9 4160.2 5927.6 6022.8 6050.8 6055.4 6062.7 5818.4 5821.2 5824.7 5825.5 5828.6 5801.4 5808.2 5810.3 5814.4 5830.7 5580.7 5689.3 5689.8 5696.6 5698.4 5840.1 5849.3 5856.3 5858.1 5861.9 5692.4 5692.9 5696.3 5697.1 5698.4 09:12:17 INFO - 2015-11-19 09:12:17,941 DEBUG : BROWSER_OUTPUT: 09:12:17 INFO - 2015-11-19 09:12:17,941 DEBUG : BROWSER_OUTPUT: [#5] yui.html Cycles:180 Average:11670.11 Median:43495.68 stddev:13509.88 (31.1%) stddev-sans-first:13522.50 09:12:17 INFO - 2015-11-19 09:12:17,941 DEBUG : BROWSER_OUTPUT: Values: 665.7 733.7 737.5 752.4 815.9 10953.6 11184.3 11206.6 11207.4 11224.5 11325.3 11431.4 11459.4 11721.3 12451.4 793.2 805.0 805.3 805.6 808.4 791.4 794.6 798.3 798.8 799.9 829.8 839.1 839.8 840.2 840.9 838.2 838.6 839.2 839.5 839.9 619.8 620.2 620.5 620.6 621.0 10910.5 11024.2 11046.9 11047.7 11057.7 9597.7 9985.3 10050.4 10057.8 10245.5 9923.6 10138.1 10174.2 10401.6 10429.1 2880.9 2901.3 2924.4 2955.1 2956.4 31858.7 31968.2 35043.0 35152.3 36184.3 6447.8 6476.2 6524.4 6538.5 6690.9 10850.6 10850.7 10864.7 10866.1 10885.2 4643.3 5879.8 6041.1 6049.3 6127.9 3532.7 3533.7 3666.9 3672.6 3685.6 2487.4 2495.5 2502.6 2507.2 2511.9 382.2 393.7 397.2 397.7 401.3 458.2 534.8 549.1 556.9 617.5 7719.4 8219.0 8239.1 8361.5 8534.8 492.2 622.0 624.7 629.3 629.7 3571.3 3695.4 3814.2 3870.9 3896.4 48842.0 49348.8 49376.3 49644.3 49655.0 44368.0 45081.3 45182.1 45280.3 45413.5 41892.6 42307.4 42318.8 42435.4 42623.4 7744.1 7823.0 7874.9 7913.4 7926.2 27117.7 31445.7 32319.5 32555.8 32589.7 36726.4 37291.6 37407.4 37474.6 37608.4 5606.8 6403.6 6808.6 6850.6 6997.5 11750.4 11805.8 11849.7 11879.5 11906.2 10592.4 10620.0 10838.6 10877.9 11644.1 10115.0 10356.2 10457.6 10467.5 10530.0 9627.9 10318.3 10335.7 10568.4 10760.2 8902.5 9262.7 9542.7 9558.1 9582.7 9006.6 9185.9 9216.1 9256.2 9335.2 09:12:17 INFO - 2015-11-19 09:12:17,942 DEBUG : BROWSER_OUTPUT: -------- Summary: end -------- 09:12:17 INFO - 2015-11-19 09:12:17,942 DEBUG : BROWSER_OUTPUT: 09:12:18 INFO - 2015-11-19 09:12:18,657 INFO : Browser exited with error code: 0 09:12:18 INFO - 2015-11-19 09:12:18,678 INFO : Completed test dromaeo_css (00:18:37) 09:12:18 INFO - 2015-11-19 09:12:18,678 INFO : Starting test kraken 09:12:18 INFO - 2015-11-19 09:12:18,679 DEBUG : operating with platform_type : linux_ 09:12:18 INFO - 2015-11-19 09:12:18,679 INFO : Initialising browser for kraken test... 09:12:18 INFO - 2015-11-19 09:12:18,685 DEBUG : command line: /builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpWoSTkk/profile http://localhost:59401/getInfo.html 09:12:23 INFO - 2015-11-19 09:12:23,098 DEBUG : BROWSER_OUTPUT: __metrics Screen width/height:1600/1200 09:12:23 INFO - 2015-11-19 09:12:23,098 DEBUG : BROWSER_OUTPUT: colorDepth:24 09:12:23 INFO - 2015-11-19 09:12:23,098 DEBUG : BROWSER_OUTPUT: Browser inner width/height: 1024/697 09:12:23 INFO - 2015-11-19 09:12:23,098 DEBUG : BROWSER_OUTPUT: __metrics 09:12:23 INFO - 2015-11-19 09:12:23,186 DEBUG : BROWSER_OUTPUT: JavaScript error: resource:///modules/WebappManager.jsm, line 48: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 09:12:24 INFO - 2015-11-19 09:12:24,656 INFO : Browser initialized. 09:12:24 INFO - 2015-11-19 09:12:24,656 INFO : Running cycle 1/1 for kraken test... 09:12:24 INFO - 2015-11-19 09:12:24,657 DEBUG : command line: /builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpWoSTkk/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1 09:12:36 INFO - 2015-11-19 09:12:36,556 DEBUG : BROWSER_OUTPUT: RSS: Main: 140734464 09:12:36 INFO - 2015-11-19 09:12:36,557 DEBUG : BROWSER_OUTPUT: 09:12:39 INFO - 2015-11-19 09:12:39,177 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:59401/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:59401/tests/kraken/driver.html?testName=audio-beat-detection) 09:12:39 INFO - 2015-11-19 09:12:39,763 DEBUG : BROWSER_OUTPUT: RSS: Main: 179830784 09:12:39 INFO - 2015-11-19 09:12:39,763 DEBUG : BROWSER_OUTPUT: 09:12:42 INFO - 2015-11-19 09:12:42,474 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:59401/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:59401/tests/kraken/driver.html?testName=audio-dft) 09:12:43 INFO - 2015-11-19 09:12:43,047 DEBUG : BROWSER_OUTPUT: RSS: Main: 168124416 09:12:43 INFO - 2015-11-19 09:12:43,048 DEBUG : BROWSER_OUTPUT: 09:12:46 INFO - 2015-11-19 09:12:46,067 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:59401/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:59401/tests/kraken/driver.html?testName=audio-fft) 09:12:46 INFO - 2015-11-19 09:12:46,634 DEBUG : BROWSER_OUTPUT: RSS: Main: 151818240 09:12:46 INFO - 2015-11-19 09:12:46,634 DEBUG : BROWSER_OUTPUT: 09:12:48 INFO - 2015-11-19 09:12:48,651 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:59401/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:59401/tests/kraken/driver.html?testName=audio-oscillator) 09:12:49 INFO - 2015-11-19 09:12:49,219 DEBUG : BROWSER_OUTPUT: RSS: Main: 154804224 09:12:49 INFO - 2015-11-19 09:12:49,219 DEBUG : BROWSER_OUTPUT: 09:12:51 INFO - 2015-11-19 09:12:51,413 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:59401/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:59401/tests/kraken/driver.html?testName=imaging-gaussian-blur) 09:12:51 INFO - 2015-11-19 09:12:51,974 DEBUG : BROWSER_OUTPUT: RSS: Main: 156106752 09:12:51 INFO - 2015-11-19 09:12:51,974 DEBUG : BROWSER_OUTPUT: 09:12:54 INFO - 2015-11-19 09:12:54,933 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:59401/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:59401/tests/kraken/driver.html?testName=imaging-darkroom) 09:12:55 INFO - 2015-11-19 09:12:55,506 DEBUG : BROWSER_OUTPUT: RSS: Main: 155348992 09:12:55 INFO - 2015-11-19 09:12:55,506 DEBUG : BROWSER_OUTPUT: 09:12:58 INFO - 2015-11-19 09:12:58,989 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:59401/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:59401/tests/kraken/driver.html?testName=imaging-desaturate) 09:12:59 INFO - 2015-11-19 09:12:59,570 DEBUG : BROWSER_OUTPUT: RSS: Main: 157835264 09:12:59 INFO - 2015-11-19 09:12:59,570 DEBUG : BROWSER_OUTPUT: 09:13:02 INFO - 2015-11-19 09:13:02,388 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:59401/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:59401/tests/kraken/driver.html?testName=json-parse-financial) 09:13:02 INFO - 2015-11-19 09:13:02,971 DEBUG : BROWSER_OUTPUT: RSS: Main: 156999680 09:13:02 INFO - 2015-11-19 09:13:02,971 DEBUG : BROWSER_OUTPUT: 09:13:04 INFO - 2015-11-19 09:13:04,701 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:59401/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:59401/tests/kraken/driver.html?testName=json-stringify-tinderbox) 09:13:05 INFO - 2015-11-19 09:13:05,267 DEBUG : BROWSER_OUTPUT: RSS: Main: 162467840 09:13:05 INFO - 2015-11-19 09:13:05,267 DEBUG : BROWSER_OUTPUT: 09:13:07 INFO - 2015-11-19 09:13:07,149 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:59401/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:59401/tests/kraken/driver.html?testName=stanford-crypto-aes) 09:13:07 INFO - 2015-11-19 09:13:07,751 DEBUG : BROWSER_OUTPUT: RSS: Main: 163381248 09:13:07 INFO - 2015-11-19 09:13:07,751 DEBUG : BROWSER_OUTPUT: 09:13:09 INFO - 2015-11-19 09:13:09,848 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:59401/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:59401/tests/kraken/driver.html?testName=stanford-crypto-ccm) 09:13:10 INFO - 2015-11-19 09:13:10,429 DEBUG : BROWSER_OUTPUT: RSS: Main: 169709568 09:13:10 INFO - 2015-11-19 09:13:10,429 DEBUG : BROWSER_OUTPUT: 09:13:12 INFO - 2015-11-19 09:13:12,969 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:59401/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:59401/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 09:13:13 INFO - 2015-11-19 09:13:13,554 DEBUG : BROWSER_OUTPUT: RSS: Main: 177045504 09:13:13 INFO - 2015-11-19 09:13:13,555 DEBUG : BROWSER_OUTPUT: 09:13:16 INFO - 2015-11-19 09:13:16,109 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:59401/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:59401/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 09:13:16 INFO - 2015-11-19 09:13:16,682 DEBUG : BROWSER_OUTPUT: RSS: Main: 175378432 09:13:16 INFO - 2015-11-19 09:13:16,683 DEBUG : BROWSER_OUTPUT: 09:13:18 INFO - 2015-11-19 09:13:18,436 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:59401/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:59401/tests/kraken/driver.html?testName=ai-astar) 09:13:18 INFO - 2015-11-19 09:13:18,686 DEBUG : BROWSER_OUTPUT: RSS: Main: 235515904 09:13:18 INFO - 2015-11-19 09:13:18,687 DEBUG : BROWSER_OUTPUT: 09:13:18 INFO - 2015-11-19 09:13:18,688 DEBUG : BROWSER_OUTPUT: __start_tp_report 09:13:18 INFO - 2015-11-19 09:13:18,688 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load 09:13:18 INFO - 2015-11-19 09:13:18,688 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load_details 09:13:18 INFO - 2015-11-19 09:13:18,688 DEBUG : BROWSER_OUTPUT: |i|pagename|runs| 09:13:18 INFO - 2015-11-19 09:13:18,688 DEBUG : BROWSER_OUTPUT: |0;ai-astar;111;113;106;112;113;113;101;111;115;112 09:13:18 INFO - 2015-11-19 09:13:18,689 DEBUG : BROWSER_OUTPUT: |1;audio-beat-detection;150;130;151;164;129;155;154;139;172;132 09:13:18 INFO - 2015-11-19 09:13:18,689 DEBUG : BROWSER_OUTPUT: |2;audio-dft;163;160;161;160;163;160;162;160;162;163 09:13:18 INFO - 2015-11-19 09:13:18,689 DEBUG : BROWSER_OUTPUT: |3;audio-fft;74;73;81;95;73;72;73;102;88;73 09:13:18 INFO - 2015-11-19 09:13:18,689 DEBUG : BROWSER_OUTPUT: |4;audio-oscillator;92;92;129;92;92;91;124;92;92;124 09:13:18 INFO - 2015-11-19 09:13:18,690 DEBUG : BROWSER_OUTPUT: |5;imaging-gaussian-blur;110;109;110;110;109;110;109;110;109;109 09:13:18 INFO - 2015-11-19 09:13:18,690 DEBUG : BROWSER_OUTPUT: |6;imaging-darkroom;146;147;147;146;148;146;147;147;149;146 09:13:18 INFO - 2015-11-19 09:13:18,690 DEBUG : BROWSER_OUTPUT: |7;imaging-desaturate;95;95;95;95;95;95;95;95;96;95 09:13:18 INFO - 2015-11-19 09:13:18,690 DEBUG : BROWSER_OUTPUT: |8;json-parse-financial;69;69;69;69;73;69;68;77;66;67 09:13:18 INFO - 2015-11-19 09:13:18,690 DEBUG : BROWSER_OUTPUT: |9;json-stringify-tinderbox;68;69;68;69;68;68;68;68;67;68 09:13:18 INFO - 2015-11-19 09:13:18,690 DEBUG : BROWSER_OUTPUT: |10;stanford-crypto-aes;83;83;83;84;82;84;83;83;84;84 09:13:18 INFO - 2015-11-19 09:13:18,691 DEBUG : BROWSER_OUTPUT: |11;stanford-crypto-ccm;133;138;118;118;129;125;126;119;127;120 09:13:18 INFO - 2015-11-19 09:13:18,691 DEBUG : BROWSER_OUTPUT: |12;stanford-crypto-pbkdf2;147;139;147;145;149;137;146;146;144;133 09:13:18 INFO - 2015-11-19 09:13:18,691 DEBUG : BROWSER_OUTPUT: |13;stanford-crypto-sha256-iterative;73;69;69;68;69;68;69;72;69;68 09:13:18 INFO - 2015-11-19 09:13:18,691 DEBUG : BROWSER_OUTPUT: __end_tp_report 09:13:18 INFO - 2015-11-19 09:13:18,691 DEBUG : BROWSER_OUTPUT: __start_cc_report 09:13:18 INFO - 2015-11-19 09:13:18,691 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_cycle_collect,970 09:13:18 INFO - 2015-11-19 09:13:18,691 DEBUG : BROWSER_OUTPUT: __end_cc_report 09:13:18 INFO - 2015-11-19 09:13:18,691 DEBUG : BROWSER_OUTPUT: __startTimestamp1447953198687__endTimestamp 09:13:18 INFO - 2015-11-19 09:13:18,692 DEBUG : BROWSER_OUTPUT: 09:13:18 INFO - 2015-11-19 09:13:18,695 DEBUG : BROWSER_OUTPUT: ------- Summary: start ------- 09:13:18 INFO - 2015-11-19 09:13:18,695 DEBUG : BROWSER_OUTPUT: Number of tests: 14 09:13:18 INFO - 2015-11-19 09:13:18,695 DEBUG : BROWSER_OUTPUT: 09:13:18 INFO - 2015-11-19 09:13:18,695 DEBUG : BROWSER_OUTPUT: [#0] ai-astar Cycles:10 Average:110.70 Median:112.50 stddev:4.14 (3.7%) stddev-sans-first:4.39 09:13:18 INFO - 2015-11-19 09:13:18,695 DEBUG : BROWSER_OUTPUT: Values: 111.0 113.0 106.0 112.0 113.0 113.0 101.0 111.0 115.0 112.0 09:13:18 INFO - 2015-11-19 09:13:18,695 DEBUG : BROWSER_OUTPUT: 09:13:18 INFO - 2015-11-19 09:13:18,695 DEBUG : BROWSER_OUTPUT: [#1] audio-beat-detection Cycles:10 Average:147.60 Median:152.50 stddev:14.72 (9.7%) stddev-sans-first:15.59 09:13:18 INFO - 2015-11-19 09:13:18,696 DEBUG : BROWSER_OUTPUT: Values: 150.0 130.0 151.0 164.0 129.0 155.0 154.0 139.0 172.0 132.0 09:13:18 INFO - 2015-11-19 09:13:18,696 DEBUG : BROWSER_OUTPUT: 09:13:18 INFO - 2015-11-19 09:13:18,696 DEBUG : BROWSER_OUTPUT: [#2] audio-dft Cycles:10 Average:161.40 Median:162.00 stddev:1.35 (0.8%) stddev-sans-first:1.30 09:13:18 INFO - 2015-11-19 09:13:18,696 DEBUG : BROWSER_OUTPUT: Values: 163.0 160.0 161.0 160.0 163.0 160.0 162.0 160.0 162.0 163.0 09:13:18 INFO - 2015-11-19 09:13:18,696 DEBUG : BROWSER_OUTPUT: 09:13:18 INFO - 2015-11-19 09:13:18,696 DEBUG : BROWSER_OUTPUT: [#3] audio-fft Cycles:10 Average:80.40 Median:73.50 stddev:10.90 (14.8%) stddev-sans-first:11.31 09:13:18 INFO - 2015-11-19 09:13:18,696 DEBUG : BROWSER_OUTPUT: Values: 74.0 73.0 81.0 95.0 73.0 72.0 73.0 102.0 88.0 73.0 09:13:18 INFO - 2015-11-19 09:13:18,696 DEBUG : BROWSER_OUTPUT: 09:13:18 INFO - 2015-11-19 09:13:18,696 DEBUG : BROWSER_OUTPUT: [#4] audio-oscillator Cycles:10 Average:102.00 Median:92.00 stddev:16.39 (17.8%) stddev-sans-first:16.98 09:13:18 INFO - 2015-11-19 09:13:18,696 DEBUG : BROWSER_OUTPUT: Values: 92.0 92.0 129.0 92.0 92.0 91.0 124.0 92.0 92.0 124.0 09:13:18 INFO - 2015-11-19 09:13:18,696 DEBUG : BROWSER_OUTPUT: 09:13:18 INFO - 2015-11-19 09:13:18,696 DEBUG : BROWSER_OUTPUT: [#5] imaging-gaussian-blur Cycles:10 Average:109.50 Median:110.00 stddev:0.53 (0.5%) stddev-sans-first:0.53 09:13:18 INFO - 2015-11-19 09:13:18,696 DEBUG : BROWSER_OUTPUT: Values: 110.0 109.0 110.0 110.0 109.0 110.0 109.0 110.0 109.0 109.0 09:13:18 INFO - 2015-11-19 09:13:18,696 DEBUG : BROWSER_OUTPUT: 09:13:18 INFO - 2015-11-19 09:13:18,696 DEBUG : BROWSER_OUTPUT: [#6] imaging-darkroom Cycles:10 Average:146.90 Median:147.00 stddev:0.99 (0.7%) stddev-sans-first:1.00 09:13:18 INFO - 2015-11-19 09:13:18,696 DEBUG : BROWSER_OUTPUT: Values: 146.0 147.0 147.0 146.0 148.0 146.0 147.0 147.0 149.0 146.0 09:13:18 INFO - 2015-11-19 09:13:18,697 DEBUG : BROWSER_OUTPUT: 09:13:18 INFO - 2015-11-19 09:13:18,697 DEBUG : BROWSER_OUTPUT: [#7] imaging-desaturate Cycles:10 Average:95.10 Median:95.00 stddev:0.32 (0.3%) stddev-sans-first:0.33 09:13:18 INFO - 2015-11-19 09:13:18,697 DEBUG : BROWSER_OUTPUT: Values: 95.0 95.0 95.0 95.0 95.0 95.0 95.0 95.0 96.0 95.0 09:13:18 INFO - 2015-11-19 09:13:18,697 DEBUG : BROWSER_OUTPUT: 09:13:18 INFO - 2015-11-19 09:13:18,697 DEBUG : BROWSER_OUTPUT: [#8] json-parse-financial Cycles:10 Average:69.60 Median:69.00 stddev:3.17 (4.6%) stddev-sans-first:3.35 09:13:18 INFO - 2015-11-19 09:13:18,697 DEBUG : BROWSER_OUTPUT: Values: 69.0 69.0 69.0 69.0 73.0 69.0 68.0 77.0 66.0 67.0 09:13:18 INFO - 2015-11-19 09:13:18,697 DEBUG : BROWSER_OUTPUT: 09:13:18 INFO - 2015-11-19 09:13:18,697 DEBUG : BROWSER_OUTPUT: [#9] json-stringify-tinderbox Cycles:10 Average:68.10 Median:68.00 stddev:0.57 (0.8%) stddev-sans-first:0.60 09:13:18 INFO - 2015-11-19 09:13:18,697 DEBUG : BROWSER_OUTPUT: Values: 68.0 69.0 68.0 69.0 68.0 68.0 68.0 68.0 67.0 68.0 09:13:18 INFO - 2015-11-19 09:13:18,697 DEBUG : BROWSER_OUTPUT: 09:13:18 INFO - 2015-11-19 09:13:18,697 DEBUG : BROWSER_OUTPUT: [#10] stanford-crypto-aes Cycles:10 Average:83.30 Median:83.50 stddev:0.67 (0.8%) stddev-sans-first:0.71 09:13:18 INFO - 2015-11-19 09:13:18,697 DEBUG : BROWSER_OUTPUT: Values: 83.0 83.0 83.0 84.0 82.0 84.0 83.0 83.0 84.0 84.0 09:13:18 INFO - 2015-11-19 09:13:18,697 DEBUG : BROWSER_OUTPUT: 09:13:18 INFO - 2015-11-19 09:13:18,697 DEBUG : BROWSER_OUTPUT: [#11] stanford-crypto-ccm Cycles:10 Average:125.30 Median:126.50 stddev:6.77 (5.3%) stddev-sans-first:6.58 09:13:18 INFO - 2015-11-19 09:13:18,697 DEBUG : BROWSER_OUTPUT: Values: 133.0 138.0 118.0 118.0 129.0 125.0 126.0 119.0 127.0 120.0 09:13:18 INFO - 2015-11-19 09:13:18,697 DEBUG : BROWSER_OUTPUT: 09:13:18 INFO - 2015-11-19 09:13:18,698 DEBUG : BROWSER_OUTPUT: [#12] stanford-crypto-pbkdf2 Cycles:10 Average:143.30 Median:146.00 stddev:5.19 (3.6%) stddev-sans-first:5.33 09:13:18 INFO - 2015-11-19 09:13:18,698 DEBUG : BROWSER_OUTPUT: Values: 147.0 139.0 147.0 145.0 149.0 137.0 146.0 146.0 144.0 133.0 09:13:18 INFO - 2015-11-19 09:13:18,698 DEBUG : BROWSER_OUTPUT: 09:13:18 INFO - 2015-11-19 09:13:18,698 DEBUG : BROWSER_OUTPUT: [#13] stanford-crypto-sha256-iterative Cycles:10 Average:69.40 Median:69.00 stddev:1.71 (2.5%) stddev-sans-first:1.22 09:13:18 INFO - 2015-11-19 09:13:18,698 DEBUG : BROWSER_OUTPUT: Values: 73.0 69.0 69.0 68.0 69.0 68.0 69.0 72.0 69.0 68.0 09:13:18 INFO - 2015-11-19 09:13:18,698 DEBUG : BROWSER_OUTPUT: -------- Summary: end -------- 09:13:18 INFO - 2015-11-19 09:13:18,698 DEBUG : BROWSER_OUTPUT: 09:13:19 INFO - 2015-11-19 09:13:19,694 INFO : Browser exited with error code: 0 09:13:19 INFO - 2015-11-19 09:13:19,742 INFO : Completed test kraken (00:01:01) 09:13:19 INFO - 2015-11-19 09:13:19,742 INFO : Starting test v8_7 09:13:19 INFO - 2015-11-19 09:13:19,742 DEBUG : operating with platform_type : linux_ 09:13:19 INFO - 2015-11-19 09:13:19,742 INFO : Initialising browser for v8_7 test... 09:13:19 INFO - 2015-11-19 09:13:19,748 DEBUG : command line: /builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpMSRzLf/profile http://localhost:59401/getInfo.html 09:13:23 INFO - 2015-11-19 09:13:23,890 DEBUG : BROWSER_OUTPUT: __metrics Screen width/height:1600/1200 09:13:23 INFO - 2015-11-19 09:13:23,890 DEBUG : BROWSER_OUTPUT: colorDepth:24 09:13:23 INFO - 2015-11-19 09:13:23,890 DEBUG : BROWSER_OUTPUT: Browser inner width/height: 1024/697 09:13:23 INFO - 2015-11-19 09:13:23,891 DEBUG : BROWSER_OUTPUT: __metrics 09:13:24 INFO - 2015-11-19 09:13:24,047 DEBUG : BROWSER_OUTPUT: JavaScript error: resource:///modules/WebappManager.jsm, line 48: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 09:13:25 INFO - 2015-11-19 09:13:25,368 INFO : Browser initialized. 09:13:25 INFO - 2015-11-19 09:13:25,368 INFO : Running cycle 1/1 for v8_7 test... 09:13:25 INFO - 2015-11-19 09:13:25,369 DEBUG : command line: /builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpMSRzLf/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/v8_7/v8.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1 09:13:37 INFO - 2015-11-19 09:13:37,303 DEBUG : BROWSER_OUTPUT: RSS: Main: 142241792 09:13:37 INFO - 2015-11-19 09:13:37,304 DEBUG : BROWSER_OUTPUT: 09:13:58 INFO - 2015-11-19 09:13:58,756 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:59401/tests/v8_7/run.html (next: http://localhost:59401/tests/v8_7/run.html) 09:13:59 INFO - 2015-11-19 09:13:59,003 DEBUG : BROWSER_OUTPUT: RSS: Main: 447307776 09:13:59 INFO - 2015-11-19 09:13:59,003 DEBUG : BROWSER_OUTPUT: 09:13:59 INFO - 2015-11-19 09:13:59,003 DEBUG : BROWSER_OUTPUT: __start_tp_report 09:13:59 INFO - 2015-11-19 09:13:59,003 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load 09:13:59 INFO - 2015-11-19 09:13:59,003 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load_details 09:13:59 INFO - 2015-11-19 09:13:59,003 DEBUG : BROWSER_OUTPUT: |i|pagename|runs| 09:13:59 INFO - 2015-11-19 09:13:59,004 DEBUG : BROWSER_OUTPUT: |0;Richards;162.60162601626016 09:13:59 INFO - 2015-11-19 09:13:59,004 DEBUG : BROWSER_OUTPUT: |1;DeltaBlue;191.60758766047135 09:13:59 INFO - 2015-11-19 09:13:59,004 DEBUG : BROWSER_OUTPUT: |2;Encrypt;278.78449958182324 09:13:59 INFO - 2015-11-19 09:13:59,004 DEBUG : BROWSER_OUTPUT: |3;Decrypt;5015 09:13:59 INFO - 2015-11-19 09:13:59,004 DEBUG : BROWSER_OUTPUT: |4;RayTrace;2004.0080160320642 09:13:59 INFO - 2015-11-19 09:13:59,004 DEBUG : BROWSER_OUTPUT: |5;Earley;783.6990595611285 09:13:59 INFO - 2015-11-19 09:13:59,004 DEBUG : BROWSER_OUTPUT: |6;Boyer;12432.098765432098 09:13:59 INFO - 2015-11-19 09:13:59,004 DEBUG : BROWSER_OUTPUT: |7;RegExp;25948.71794871795 09:13:59 INFO - 2015-11-19 09:13:59,005 DEBUG : BROWSER_OUTPUT: |8;Splay;610.8735491753207 09:13:59 INFO - 2015-11-19 09:13:59,005 DEBUG : BROWSER_OUTPUT: |9;NavierStokes;4887.804878048781 09:13:59 INFO - 2015-11-19 09:13:59,005 DEBUG : BROWSER_OUTPUT: __end_tp_report 09:13:59 INFO - 2015-11-19 09:13:59,005 DEBUG : BROWSER_OUTPUT: __startTimestamp1447953239001__endTimestamp 09:13:59 INFO - 2015-11-19 09:13:59,005 DEBUG : BROWSER_OUTPUT: 09:13:59 INFO - 2015-11-19 09:13:59,006 DEBUG : BROWSER_OUTPUT: ------- Summary: start ------- 09:13:59 INFO - 2015-11-19 09:13:59,006 DEBUG : BROWSER_OUTPUT: Number of tests: 10 09:13:59 INFO - 2015-11-19 09:13:59,006 DEBUG : BROWSER_OUTPUT: 09:13:59 INFO - 2015-11-19 09:13:59,006 DEBUG : BROWSER_OUTPUT: [#0] Richards Cycles:1 Average:162.60 Median:162.60 stddev:0.00 (0.0%) 09:13:59 INFO - 2015-11-19 09:13:59,007 DEBUG : BROWSER_OUTPUT: Values: 162.6 09:13:59 INFO - 2015-11-19 09:13:59,007 DEBUG : BROWSER_OUTPUT: 09:13:59 INFO - 2015-11-19 09:13:59,007 DEBUG : BROWSER_OUTPUT: [#1] DeltaBlue Cycles:1 Average:191.61 Median:191.61 stddev:0.00 (0.0%) 09:13:59 INFO - 2015-11-19 09:13:59,007 DEBUG : BROWSER_OUTPUT: Values: 191.6 09:13:59 INFO - 2015-11-19 09:13:59,008 DEBUG : BROWSER_OUTPUT: 09:13:59 INFO - 2015-11-19 09:13:59,008 DEBUG : BROWSER_OUTPUT: [#2] Encrypt Cycles:1 Average:278.78 Median:278.78 stddev:0.00 (0.0%) 09:13:59 INFO - 2015-11-19 09:13:59,008 DEBUG : BROWSER_OUTPUT: Values: 278.8 09:13:59 INFO - 2015-11-19 09:13:59,009 DEBUG : BROWSER_OUTPUT: 09:13:59 INFO - 2015-11-19 09:13:59,009 DEBUG : BROWSER_OUTPUT: [#3] Decrypt Cycles:1 Average:5015.00 Median:5015.00 stddev:0.00 (0.0%) 09:13:59 INFO - 2015-11-19 09:13:59,009 DEBUG : BROWSER_OUTPUT: Values: 5015.0 09:13:59 INFO - 2015-11-19 09:13:59,009 DEBUG : BROWSER_OUTPUT: 09:13:59 INFO - 2015-11-19 09:13:59,010 DEBUG : BROWSER_OUTPUT: [#4] RayTrace Cycles:1 Average:2004.01 Median:2004.01 stddev:0.00 (0.0%) 09:13:59 INFO - 2015-11-19 09:13:59,010 DEBUG : BROWSER_OUTPUT: Values: 2004.0 09:13:59 INFO - 2015-11-19 09:13:59,010 DEBUG : BROWSER_OUTPUT: 09:13:59 INFO - 2015-11-19 09:13:59,010 DEBUG : BROWSER_OUTPUT: [#5] Earley Cycles:1 Average:783.70 Median:783.70 stddev:0.00 (0.0%) 09:13:59 INFO - 2015-11-19 09:13:59,011 DEBUG : BROWSER_OUTPUT: Values: 783.7 09:13:59 INFO - 2015-11-19 09:13:59,011 DEBUG : BROWSER_OUTPUT: 09:13:59 INFO - 2015-11-19 09:13:59,011 DEBUG : BROWSER_OUTPUT: [#6] Boyer Cycles:1 Average:12432.10 Median:12432.10 stddev:0.00 (0.0%) 09:13:59 INFO - 2015-11-19 09:13:59,012 DEBUG : BROWSER_OUTPUT: Values: 12432.1 09:13:59 INFO - 2015-11-19 09:13:59,012 DEBUG : BROWSER_OUTPUT: 09:13:59 INFO - 2015-11-19 09:13:59,012 DEBUG : BROWSER_OUTPUT: [#7] RegExp Cycles:1 Average:25948.72 Median:25948.72 stddev:0.00 (0.0%) 09:13:59 INFO - 2015-11-19 09:13:59,012 DEBUG : BROWSER_OUTPUT: Values: 25948.7 09:13:59 INFO - 2015-11-19 09:13:59,012 DEBUG : BROWSER_OUTPUT: 09:13:59 INFO - 2015-11-19 09:13:59,013 DEBUG : BROWSER_OUTPUT: [#8] Splay Cycles:1 Average:610.87 Median:610.87 stddev:0.00 (0.0%) 09:13:59 INFO - 2015-11-19 09:13:59,013 DEBUG : BROWSER_OUTPUT: Values: 610.9 09:13:59 INFO - 2015-11-19 09:13:59,013 DEBUG : BROWSER_OUTPUT: 09:13:59 INFO - 2015-11-19 09:13:59,013 DEBUG : BROWSER_OUTPUT: [#9] NavierStokes Cycles:1 Average:4887.80 Median:4887.80 stddev:0.00 (0.0%) 09:13:59 INFO - 2015-11-19 09:13:59,013 DEBUG : BROWSER_OUTPUT: Values: 4887.8 09:13:59 INFO - 2015-11-19 09:13:59,013 DEBUG : BROWSER_OUTPUT: -------- Summary: end -------- 09:13:59 INFO - 2015-11-19 09:13:59,014 DEBUG : BROWSER_OUTPUT: 09:13:59 INFO - 2015-11-19 09:13:59,938 INFO : Browser exited with error code: 0 09:13:59 INFO - 2015-11-19 09:13:59,952 INFO : Completed test v8_7 (00:00:40) 09:13:59 INFO - 2015-11-19 09:13:59,995 INFO : Completed test suite (00:20:18) 09:13:59 INFO - 2015-11-19 09:13:59,995 DEBUG : Working with test: dromaeo_css 09:13:59 INFO - 2015-11-19 09:13:59,995 DEBUG : Generating results file: dromaeo_css 09:13:59 INFO - 2015-11-19 09:13:59,997 DEBUG : Working with test: kraken 09:13:59 INFO - 2015-11-19 09:13:59,997 DEBUG : Generating results file: kraken 09:13:59 INFO - 2015-11-19 09:13:59,997 INFO : javascript benchmark 09:13:59 INFO - 2015-11-19 09:13:59,997 DEBUG : Working with test: v8_7 09:13:59 INFO - 2015-11-19 09:13:59,997 DEBUG : Generating results file: v8_7 09:13:59 INFO - 2015-11-19 09:13:59,998 INFO : Posting result 0 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 09:14:00 INFO - 2015-11-19 09:14:00,047 DEBUG : process_Request line: dromaeo_css graph.html#tests=[[72,132,35]] 09:14:00 INFO - 2015-11-19 09:14:00,047 DEBUG : process_Request line: dromaeo_css 6055.75 graph.html#tests=[[72,132,35]] 09:14:00 INFO - 2015-11-19 09:14:00,047 INFO : Posting result 1 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 09:14:00 INFO - 2015-11-19 09:14:00,075 DEBUG : process_Request line: kraken 1512.60 graph.html#tests=[[232,132,35]] 09:14:00 INFO - 2015-11-19 09:14:00,075 INFO : Posting result 2 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 09:14:00 INFO - 2015-11-19 09:14:00,105 DEBUG : process_Request line: v8_7 19838.15 graph.html#tests=[[230,132,35]] 09:14:00 INFO - 2015-11-19 09:14:00,106 INFO : javascript benchmark 09:14:00 INFO - 2015-11-19 09:14:00,110 INFO : PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"lowerIsBetter": false, "subtests": [{"lowerIsBetter": false, "replicates": [2597.7142514323423, 2712.64735584374, 2731.426400455904, 2743.3827388837503, 2749.024096445761, 4603.079384123172, 4714.292856071591, 4768.30859525369, 4818.927716084258, 4859.659823812334, 4672.556107169813, 4675.251959686451, 4729.0, 4754.6434017448655, 4758.0, 4355.150745604608, 4357.956420435787, 4454.0423808881005, 4516.954830451687, 4565.0, 4230.851920182794, 4454.97772511137, 4487.528809475007, 4526.311607302494, 4586.8394606188795, 4302.827886884521, 4338.891527711801, 4455.997400584875, 4458.996725736716, 4503.729776213438, 4414.757188354639, 4430.778461076933, 4438.312061630452, 4449.065696203801, 4460.442444694413, 4398.626116780046, 4402.933955990663, 4410.845620403303, 4440.600345968846, 4454.220511410523, 4537.228671125917, 4642.280446530793, 4659.114768194032, 4660.4174478190225, 4762.857114286577, 5106.9489305106845, 5133.30700355451, 5135.12702840518, 5138.46046165151, 5139.537441630234, 5155.329807125087, 5159.097157997336, 5162.22566615007, 5198.090334191539, 5216.608754343401, 4626.653001024903, 4629.051044535862, 4711.976440117777, 4744.288356746447, 4750.168720473903, 5277.577793776489, 5349.304590403301, 5356.143017117242, 5359.14253719403, 5399.757010934517, 5104.948950510522, 5136.383633963948, 5137.255098010843, 5137.743112844343, 5181.663191892515, 4941.703497790144, 5074.340335756402, 5075.543201111917, 5135.87160320995, 5277.472252774692, 5159.045576568347, 5161.096808058574, 5161.509656582619, 5192.350956130484, 5201.817936372209, 5124.666896651705, 5125.103106956342, 5139.254808052811, 5143.382794064736, 5177.741112944338, 4137.069159439162, 4242.703010789215, 4244.511881133647, 4329.28566786483, 4410.140022695544, 3744.756590821588, 3814.9618503815163, 3820.503334566489, 3851.287511810324, 3862.343401621731, 4363.890902727394, 4400.4939431965095, 4401.889952751207, 4413.801378937891, 4442.53353397895, 4878.243872199815, 5012.147934851084, 5014.147594908874, 5119.974400127976, 5187.351581052369, 4299.613034826881, 4362.454693163355, 4375.037491751809, 4392.121575684812, 4419.270820314612, 4632.2125238709505, 4634.165850147006, 4639.443266808004, 4643.605293550086, 4657.161710892072, 4644.256918893096, 4918.163912135017, 4922.852314430573, 4923.187674033744, 4935.161022626162, 5037.370328708911, 5090.618203634668, 5105.744712764421, 5149.665271757323, 5182.300389447376, 4856.902861942812, 4871.415430148405, 4875.293082503088, 4894.877628059185, 4915.410150781929, 5045.394552653705, 5050.671706339076, 5058.519440653132, 5063.468335824686, 5089.898202036013, 4907.68100073494, 4983.950160498349, 5042.949570504248, 5138.049460849755, 5307.734613269398, 4885.267209918541, 4887.242477415864, 4890.6332025097545, 4916.115099282163, 4938.234573641092, 4866.878328041827, 4888.608911287018, 4898.142825005681, 4920.827771027997, 4956.033573453142, 4633.096546173599, 4715.882102947454, 4748.952510474851, 4752.952470475251, 4847.757612119451, 4910.8281210157475, 4930.433000204879, 4934.432540257916, 4945.505449455026, 4981.128302547112, 4813.109574728686, 4821.493743156918, 4823.855284341475, 4833.081714474239, 4884.413870335582], "unit": "ms", "name": "dojo.html", "value": 4690.2218684535055}, {"lowerIsBetter": false, "replicates": [540.8458589302049, 551.0824477245386, 553.706535536166, 560.5739637875215, 562.3813804814704, 28321.150365489044, 37378.43932341017, 38061.0, 38214.0, 38230.42654360187, 40660.0, 41157.38263926043, 41189.0, 41194.0, 41209.0, 7001.544899581511, 7070.9292907070785, 7733.806654833618, 7872.3308518775975, 7886.250806173404, 10311.175105991502, 10631.734206644818, 10635.627753028646, 10635.893641063607, 10640.733981650443, 10301.79396412075, 10417.062464378205, 10423.739406514822, 10424.843627345595, 10425.478726063704, 7189.209186989427, 7394.630268486554, 10310.226732995055, 10353.637622683245, 10668.893311066868, 10033.749156271151, 10225.795484090351, 10226.744331391701, 10232.488375581266, 10236.795264094751, 37714.0, 38322.0, 38405.0, 38454.23091538154, 38570.228595427936, 3007.248187953012, 3064.6628870824193, 3095.90712278632, 3549.201429678302, 3662.432322989914, 27967.86016069927, 28330.2917427066, 28821.85589072062, 29110.27224319388, 29271.268218294714, 2920.897768578111, 2964.4960356739407, 2985.373071654955, 2997.925051873699, 3058.5565093061605, 228719.0, 229701.0, 229886.0, 229975.0, 230638.84680576657, 52911.73544132332, 53996.73001634967, 57022.7148864253, 57028.144577831365, 58536.0, 51985.220221696705, 52101.7394913023, 52198.739006305485, 52285.73857130766, 52397.73801131046, 13795.517156899461, 13917.095388799695, 13945.0, 13987.23070231147, 13989.580312590639, 10394.376337419779, 10466.267361284788, 10484.842727359095, 10494.108000820015, 10566.947165264279, 19550.21799128019, 19585.216591336186, 19690.50773730668, 19742.11160497781, 19855.60288794245, 7439.293267139613, 7609.961950190324, 7676.731314403969, 7684.346830519356, 7698.191689872595, 891.8662200669821, 927.9164875161268, 1067.0449947297282, 1071.689210129054, 1086.0, 26145.0, 26440.867795661285, 27167.320816979733, 27288.72711272862, 27609.171724848286, 949.1173208915775, 974.0746291023556, 990.4156547636928, 992.156666833186, 1058.5183741397645, 14113.85886141146, 14489.855101448851, 14507.637309067357, 14776.92611536957, 14782.926085369505, 267494.0, 268260.0, 269559.0, 270077.9488307677, 270844.0, 45937.77031114823, 46092.769536152104, 46132.30801537979, 46154.307685384745, 46171.538284617396, 1040.443362800913, 1243.0, 1254.9874501254872, 1259.571745606498, 1275.9808602870964, 20997.580048399253, 26486.072987445346, 27221.72778272192, 27399.589006165323, 27569.862150689118, 44221.778891105336, 44240.0, 44526.0, 44607.0, 44646.77676611596, 243389.0, 252203.0, 255539.0, 305713.0, 309143.0, 26540.601890972037, 26649.733502664723, 26699.33251668724, 26897.462050759266, 26995.59506607363, 37428.2514349706, 37939.620603793606, 38527.807360963016, 40269.59730402775, 42301.576984231, 30862.456877155604, 31424.0, 32208.0, 32695.0, 32899.67100328966, 32066.839665801523, 32434.513482298258, 32566.185845354055, 32613.510797338535, 32839.0, 31171.064868053996, 32139.0, 32200.0, 32359.191020224684, 32378.514322285657, 28401.43197136087, 29032.274193145342, 29123.090897358867, 30026.0, 31382.0, 22586.322410327717, 23089.88455057714, 23106.38676920347, 23372.0, 23490.295291141294], "unit": "ms", "name": "ext.html", "value": 17391.562011975842}, {"lowerIsBetter": false, "replicates": [322.33759623972725, 336.5859992209583, 338.31153602419084, 342.99502457798656, 343.0377790298213, 11969.581064662738, 12413.937930310336, 14888.404463821447, 15317.84682153178, 15367.923160384196, 13032.674183145426, 14380.856191438083, 14543.0, 14565.198914059722, 14595.41618335268, 3630.52803135592, 4864.027194561084, 4904.435989861176, 5048.394192696882, 5049.0, 3599.1362073102396, 3705.851186132294, 3711.1464363196483, 3713.4244192150127, 5013.448520662724, 3689.151495156102, 3689.778613283198, 5612.971935140318, 5758.539316854642, 5809.721861190553, 5633.6619802811965, 5738.4835364816945, 5740.598158128891, 5743.253377060976, 5826.650400975955, 5004.0, 5014.047331007097, 5025.974870125662, 5029.069622119883, 5029.170186919154, 18289.268429262815, 18765.249390024383, 18990.52523686905, 19019.239230430765, 19233.0, 1874.390822982536, 1904.7619047619048, 1919.64486569985, 1957.2855907593769, 1987.3640435060786, 12267.325297108655, 12307.0, 12416.875831241752, 12444.688882777913, 12697.174683645533, 1784.4379020608467, 1801.5586181385513, 1809.1406581873637, 1843.0784607696153, 1843.8880998451093, 53569.46430535723, 54642.45357546413, 55176.72411637956, 55529.44470555283, 55825.0, 6162.537809664203, 6230.875382492415, 6258.280297765724, 6263.4362907338555, 6316.557840951181, 7295.671694773748, 7297.270272972766, 7301.744438944612, 7305.963470182722, 7316.451266154953, 4916.287138364917, 4929.778159982738, 4971.676841005323, 4971.776270067856, 4972.577330926912, 5085.491450854959, 5088.0587091388215, 5130.897382052338, 5135.229715542624, 5135.948640513547, 2848.9145325640266, 2890.421915616885, 2899.260688524455, 2913.9417211656073, 2926.9707302927122, 980.6959842448721, 1026.5175367577226, 1028.4600584693096, 1077.159815344033, 1081.5241293830688, 383.8522168964969, 389.0274314214464, 399.1458279282338, 412.27028160156357, 416.4939598387913, 10102.242331824995, 10244.385336879812, 10305.0, 10403.94798026005, 10497.9475102624, 390.8241291418873, 402.87712247764125, 413.24788884231015, 416.6333626408741, 442.52649664858933, 5608.691521966331, 5682.204491371212, 5764.221830052889, 5843.795467158629, 5978.880422391528, 443990.6802795921, 444523.0, 448206.0, 470966.0, 477339.0, 59091.70454147702, 59996.40003599908, 60340.0, 61550.38449615536, 64817.67591162014, 468.67427138139345, 479.99520004800206, 481.1819906159543, 481.4703825791601, 481.98072077117223, 9999.500024998575, 10059.647912323033, 10063.597456101674, 10152.847707284249, 10177.440240786827, 30014.24964375908, 30062.699373006864, 30270.243243919078, 30278.394432111676, 31282.843585781924, 36810.81594592117, 36990.63009369872, 38494.615053849106, 38978.80510597429, 39203.0, 5595.804146854841, 5674.404187560247, 5677.5457963362005, 5682.176084467646, 5692.430756924275, 10339.379637221791, 10454.372737635766, 10929.453527323443, 10936.945315273373, 10948.726281843017, 9464.195543378615, 9469.384490008128, 9728.319017668695, 9801.411915285105, 9807.21542276602, 9555.808883822423, 9581.425114493153, 9614.375065620712, 9798.951005244928, 9819.801980198019, 9555.61777528891, 9893.25800564946, 9920.0, 9979.550920208752, 9996.100350968447, 5737.856553586027, 5828.446297601721, 5879.088741245114, 5900.262467191601, 5901.940980590139, 9687.70936871895, 9759.414435133915, 9979.850302245617, 10200.795984080129, 10210.948945255226], "unit": "ms", "name": "jquery.html", "value": 6450.720261435116}, {"lowerIsBetter": false, "replicates": [1433.0685054714427, 1536.9615759606008, 1537.7155226283132, 1605.9839401605982, 1665.4254282272616, 5857.7364018619155, 6758.594484330937, 6863.828404289889, 6877.896831547519, 6897.206821215562, 6957.686904089315, 6977.89533157003, 6985.790426287207, 7007.544509606884, 7008.96495517523, 1684.679910816947, 1719.6818588561093, 2038.5413282011577, 2052.179128348665, 2054.7637021742466, 2091.5816836632657, 2133.381319417367, 2138.0592539282743, 2139.326112274636, 2139.81811546018, 2069.492974221318, 2082.9895850520725, 2114.2811444109075, 2124.4157856589486, 2127.117246342766, 1590.379751896767, 1619.757036444531, 1625.6261059956275, 1888.0276657521388, 1956.1392987085637, 2094.7695753467106, 2104.968425473619, 2108.620448319302, 2109.69409435631, 2110.556783075541, 6920.273371295992, 7039.260877607829, 7039.648017599099, 7044.295570442966, 7071.717131314741, 4264.552222016706, 4299.097189590189, 4315.784210789448, 4330.0, 4336.3278691802825, 2633.4469761350138, 2708.1604702542077, 2723.904663336774, 2742.657167854018, 2743.6158937748733, 819.2258315891485, 843.1863251961886, 845.0915266088979, 863.0290922711949, 870.1124852650262, 9502.619895204183, 9541.141297283279, 9557.856632150453, 9560.713178604654, 9574.904250957541, 3852.0, 3900.5904380039688, 3975.920481590352, 4030.435738996543, 4031.576684448091, 7941.324987376022, 7962.681492740341, 7962.960185199037, 7969.442139050327, 7980.441369104107, 4357.782110894506, 4358.193734159191, 4371.147626212922, 4373.037931655031, 4373.781310934441, 3933.1150491139265, 3933.193695292458, 3933.842646294116, 3934.232824599233, 3935.842566297373, 3314.436545787222, 3403.4724617684296, 3424.503447000221, 3424.70889974355, 3432.3993301172195, 1153.5385845661635, 1161.0, 1161.0015386767373, 1161.9477123529462, 1173.906087512997, 1016.9491525423699, 1157.2651366382408, 1170.3855475875234, 1190.6249531397582, 1191.4697959407981, 6590.044443555754, 6635.668216589248, 6671.0, 6678.298778628271, 6733.057371967929, 417.8433087592153, 427.8374217797217, 429.0239704671834, 430.4791202644772, 430.72003197920975, 4844.515548445127, 4926.75366231687, 5079.4412614612365, 5164.509371609691, 5403.891922161535, 7942.960285198537, 8138.198462906913, 8161.306288965505, 8205.466644668077, 8223.917760822314, 8296.626651800683, 8936.776580585407, 9028.277737780962, 9067.727968160965, 9079.319051071196, 6609.801705948829, 6643.833904152435, 6663.267040625527, 6682.498812589075, 6715.127033485714, 6356.745730170742, 6401.263854656774, 6474.741010359721, 6512.479001679949, 6516.218053833571, 7418.072740907387, 7499.362554182738, 7511.774646760606, 7528.284812942762, 7650.0, 7442.255774422514, 7689.269519395649, 7699.461037727306, 7705.460617756703, 7730.884036739566, 5986.281646202484, 6039.48664363534, 6041.9395806041375, 6042.456178943916, 6057.1519987200945, 6595.472362210916, 6781.2879647638265, 6823.420009299265, 6836.760713375008, 6845.247022827385, 6421.0, 6449.419552240321, 6500.577462464925, 6522.869542609026, 6552.901706474502, 6026.487748541423, 6307.716152773044, 6316.842078948063, 6432.3567643237175, 6467.805965821033, 6394.4884409246215, 6441.645709486023, 6446.548741588043, 6459.386358295955, 6467.644279564669, 5948.910766338595, 6013.278406591237, 6017.007193812972, 6022.1870047543025, 6030.3668114847305, 5863.442972917566, 5902.940970590411, 5920.437558431942, 5926.881462370815, 5932.317783454785], "unit": "ms", "name": "mootools.html", "value": 3971.7104297641436}, {"lowerIsBetter": false, "replicates": [311.9906402807916, 315.44481712186547, 321.5193286037374, 323.9740820734344, 324.63154319846967, 5360.169173778061, 5498.80754173604, 5504.944950550498, 5564.944350556499, 5569.053260945644, 5321.574274058075, 5480.123180291154, 5480.616356855022, 5482.91775623366, 5488.670679759217, 4052.7365721228175, 4192.5807419258135, 4220.873373798791, 4278.657707383418, 4284.871453856374, 4139.399787030894, 4202.3696445533105, 4219.915601687964, 4220.831166753342, 4232.195882782277, 4197.895052623679, 4229.365595160735, 4229.492460904696, 4232.703710740249, 4238.851640192594, 4230.217409779185, 4237.385579091046, 4238.109996900639, 4243.957560424387, 4244.617984381421, 3719.479272901796, 3724.2737666155112, 3725.5343082114737, 3725.739198256123, 3728.9067773305615, 5186.092433824066, 5223.320968274138, 5280.762365693553, 5285.365756109253, 5300.867478313035, 4853.466118726938, 4857.368542089541, 4857.465678775332, 4863.829765958175, 4865.562099411035, 5446.101393270105, 5655.688937108457, 5763.4812866842185, 5769.423057694239, 5773.047447171211, 3924.489816323888, 3975.8807235782974, 3976.602339766029, 4017.5580686124504, 4020.336644453662, 6061.060535616986, 6078.300995385543, 6078.39216078393, 6082.60463069899, 6090.086487026937, 4160.563140870226, 4164.021454958082, 4164.83340666376, 4165.812538435777, 4166.854160104382, 4007.719459637797, 4173.603507666767, 4225.809838557272, 4229.873103806891, 4237.427947227146, 4774.928376074362, 4790.161721698689, 4791.6645834791925, 4793.808247670124, 4801.087793319258, 5772.451617096369, 5778.104393818965, 5785.190073389729, 5787.565932555075, 5788.363280039192, 1447.9131252124696, 1458.4676593043462, 1458.5624312706145, 1460.0582624207539, 1460.4377314733904, 962.3263715399248, 973.8636590877283, 982.6413359123868, 991.4348821171862, 993.8906720260766, 5045.596352291808, 5065.164247899055, 5080.796768129308, 5099.821506247264, 5103.540681338697, 5997.790077347359, 6009.669468179292, 6010.158577799111, 6018.668973206428, 6021.6989150542295, 5095.363079615048, 5100.464451232641, 5100.897982040338, 5103.77033033507, 5105.15764898795, 3164.810111393324, 3214.8231847248157, 3240.303334782986, 3250.8537115829845, 3255.0, 5690.174924635905, 5692.174634677948, 5697.202391665171, 5703.62926409782, 5704.201411802351, 6184.226971628546, 6184.6598437085495, 6185.072239164071, 6186.628802271878, 6191.473724733358, 5532.557395408277, 5688.601797874192, 5690.9146362804595, 5692.943070569324, 5698.544116470673, 5765.971170144123, 5952.672603006703, 5976.252968378953, 5982.132590774227, 5987.5808693391045, 5764.538836892954, 5895.616784908967, 5896.8820623586425, 5902.409759024235, 5943.613665111754, 5725.4560816724015, 5727.255456790591, 5729.598928074995, 5732.684702341411, 5737.368889422244, 4150.875473735793, 4155.501339839238, 4157.251694694984, 4157.8960525987095, 4160.1679664067915, 5927.585069045125, 6022.819315420545, 6050.788222412194, 6055.394460553909, 6062.666553339609, 5818.359980402068, 5821.185034095315, 5824.737886795189, 5825.533957283492, 5828.59199856006, 5801.3908539602735, 5808.15781711641, 5810.331811841692, 5814.389489103583, 5830.708464576839, 5580.720963951705, 5689.317281926195, 5689.800856969986, 5696.572757043155, 5698.401667824819, 5840.065589505659, 5849.327327357239, 5856.267966504187, 5858.062709966385, 5861.9413805861395, 5692.373838877637, 5692.8576785579035, 5696.287964004499, 5697.088465845611, 5698.401667824819], "unit": "ms", "name": "prototype.html", "value": 4338.5175170295115}, {"lowerIsBetter": false, "replicates": [665.720397433078, 733.6515155301231, 737.469022303941, 752.3717695724071, 815.9347252219823, 10953.616623418182, 11184.32894026357, 11206.607768728096, 11207.439628018597, 11224.4948977296, 11325.320480771159, 11431.42842857858, 11459.36973466459, 11721.296722196674, 12451.377431128452, 793.2186796005944, 804.9919500805005, 805.2752522729531, 805.569020573993, 808.3573559020564, 791.4459878085363, 794.5550491724624, 798.3453568074182, 798.8042929482285, 799.884016817564, 829.784256093414, 839.0812060793421, 839.7900524868783, 840.2353857989231, 840.9495430274203, 838.1618381618382, 838.6310023589601, 839.236294971573, 839.5466448118009, 839.9076101628816, 619.8047615001306, 620.1968450856107, 620.4540004795796, 620.6059152438235, 620.981370558884, 10910.5090270938, 11024.173187011007, 11046.944765276123, 11047.668569942914, 11057.668269951833, 9597.712068637882, 9985.251106166994, 10050.396976181453, 10057.798844023151, 10245.53895074716, 9923.553440095213, 10138.138258248058, 10174.236932230038, 10401.635942742043, 10429.061384475357, 2880.9279768005968, 2901.2891841498968, 2924.400497897926, 2955.069153216751, 2956.408718256357, 31858.681413185805, 31968.20079498008, 35043.0, 35152.296954060774, 36184.27631447383, 6447.838804029937, 6476.158099447041, 6524.412802847766, 6538.476921846241, 6690.866182676319, 10850.565977360975, 10850.67447976562, 10864.72838179036, 10866.130709543218, 10885.23803333759, 4643.257078867365, 5879.764809407661, 6041.093835924647, 6049.304330002106, 6127.938720612826, 3532.7350448716447, 3533.7349698772696, 3666.871659491905, 3672.6143754905884, 3685.6314368563467, 2487.403023274437, 2495.4510007798253, 2502.574562324373, 2507.1851648214038, 2511.8947663028207, 382.20882772660326, 393.683085116484, 397.16198820488745, 397.7295439101381, 401.3277759752403, 458.23017330883766, 534.7540131539536, 549.126888247688, 556.9415211402744, 617.5491890919653, 7719.421043421766, 8218.958905205436, 8239.134890836496, 8361.540115293717, 8534.78663033429, 492.1510394569339, 621.9937800622026, 624.6658037949675, 629.2826178156905, 629.7197747002632, 3571.321448924696, 3695.371786796251, 3814.237152569497, 3870.9419358709642, 3896.4350169225304, 48842.0, 49348.83139607549, 49376.25935610969, 49644.25533616998, 49655.0, 44368.0, 45081.32378014332, 45182.09635807265, 45280.3207951881, 45413.54586454093, 41892.58107418887, 42307.36538951918, 42318.78840605839, 42435.363469547985, 42623.36064959028, 7744.1094274159195, 7822.960885195537, 7874.881876771968, 7913.433162094108, 7926.167752386147, 27117.72882271152, 31445.68554314519, 32319.51520727144, 32555.837220813744, 32589.674103258665, 36726.44910326294, 37291.62708372882, 37407.43888841615, 37474.625253747115, 37608.43587346137, 5606.831795046155, 6403.583767055126, 6808.557443766139, 6850.554713943578, 6997.475189360716, 11750.353730544903, 11805.76388472243, 11849.703757406134, 11879.524819007489, 11906.166568340133, 10592.364458132228, 10620.044196022394, 10838.620648277272, 10877.891221087688, 11644.068474521848, 10115.0, 10356.223283253938, 10457.633982810565, 10467.476626168813, 10530.0, 9627.855582166134, 10318.329308594917, 10335.689929302132, 10568.365898046142, 10760.246782725135, 8902.465852048897, 9262.72211833646, 9542.666006689733, 9558.139767420966, 9582.66460673873, 9006.602790051187, 9185.908140918506, 9216.124468175512, 9256.213221876216, 9335.159835614828], "unit": "ms", "name": "yui.html", "value": 5438.801779920968}], "name": "dromaeo_css", "value": 6055.746758725907}, {"lowerIsBetter": true, "subtests": [{"lowerIsBetter": true, "replicates": [111.0, 113.0, 106.0, 112.0, 113.0, 113.0, 101.0, 111.0, 115.0, 112.0], "unit": "ms", "name": "ai-astar", "value": 110.7}, {"lowerIsBetter": true, "replicates": [150.0, 130.0, 151.0, 164.0, 129.0, 155.0, 154.0, 139.0, 172.0, 132.0], "unit": "ms", "name": "audio-beat-detection", "value": 147.6}, {"lowerIsBetter": true, "replicates": [163.0, 160.0, 161.0, 160.0, 163.0, 160.0, 162.0, 160.0, 162.0, 163.0], "unit": "ms", "name": "audio-dft", "value": 161.4}, {"lowerIsBetter": true, "replicates": [74.0, 73.0, 81.0, 95.0, 73.0, 72.0, 73.0, 102.0, 88.0, 73.0], "unit": "ms", "name": "audio-fft", "value": 80.4}, {"lowerIsBetter": true, "replicates": [92.0, 92.0, 129.0, 92.0, 92.0, 91.0, 124.0, 92.0, 92.0, 124.0], "unit": "ms", "name": "audio-oscillator", "value": 102.0}, {"lowerIsBetter": true, "replicates": [110.0, 109.0, 110.0, 110.0, 109.0, 110.0, 109.0, 110.0, 109.0, 109.0], "unit": "ms", "name": "imaging-gaussian-blur", "value": 109.5}, {"lowerIsBetter": true, "replicates": [146.0, 147.0, 147.0, 146.0, 148.0, 146.0, 147.0, 147.0, 149.0, 146.0], "unit": "ms", "name": "imaging-darkroom", "value": 146.9}, {"lowerIsBetter": true, "replicates": [95.0, 95.0, 95.0, 95.0, 95.0, 95.0, 95.0, 95.0, 96.0, 95.0], "unit": "ms", "name": "imaging-desaturate", "value": 95.1}, {"lowerIsBetter": true, "replicates": [69.0, 69.0, 69.0, 69.0, 73.0, 69.0, 68.0, 77.0, 66.0, 67.0], "unit": "ms", "name": "json-parse-financial", "value": 69.6}, {"lowerIsBetter": true, "replicates": [68.0, 69.0, 68.0, 69.0, 68.0, 68.0, 68.0, 68.0, 67.0, 68.0], "unit": "ms", "name": "json-stringify-tinderbox", "value": 68.1}, {"lowerIsBetter": true, "replicates": [83.0, 83.0, 83.0, 84.0, 82.0, 84.0, 83.0, 83.0, 84.0, 84.0], "unit": "ms", "name": "stanford-crypto-aes", "value": 83.3}, {"lowerIsBetter": true, "replicates": [133.0, 138.0, 118.0, 118.0, 129.0, 125.0, 126.0, 119.0, 127.0, 120.0], "unit": "ms", "name": "stanford-crypto-ccm", "value": 125.3}, {"lowerIsBetter": true, "replicates": [147.0, 139.0, 147.0, 145.0, 149.0, 137.0, 146.0, 146.0, 144.0, 133.0], "unit": "ms", "name": "stanford-crypto-pbkdf2", "value": 143.3}, {"lowerIsBetter": true, "replicates": [73.0, 69.0, 69.0, 68.0, 69.0, 68.0, 69.0, 72.0, 69.0, 68.0], "unit": "ms", "name": "stanford-crypto-sha256-iterative", "value": 69.4}], "name": "kraken", "value": 1512.6}, {"lowerIsBetter": false, "subtests": [{"lowerIsBetter": false, "replicates": [162.60162601626016], "unit": "score", "name": "Richards", "value": 217.10729999999992}, {"lowerIsBetter": false, "replicates": [191.60758766047135], "unit": "score", "name": "DeltaBlue", "value": 345.06984200000005}, {"lowerIsBetter": false, "replicates": [278.78449958182324], "unit": "score", "name": "Encrypt", "value": 954.7912470000005}, {"lowerIsBetter": false, "replicates": [5015.0], "unit": "score", "name": "Decrypt", "value": 53.07696909272185}, {"lowerIsBetter": false, "replicates": [2004.0080160320642], "unit": "score", "name": "RayTrace", "value": 369.254511}, {"lowerIsBetter": false, "replicates": [783.6990595611285], "unit": "score", "name": "Earley", "value": 850.4067880000003}, {"lowerIsBetter": false, "replicates": [12432.098765432098], "unit": "score", "name": "Boyer", "value": 53.608245283018846}, {"lowerIsBetter": false, "replicates": [25948.71794871795], "unit": "score", "name": "RegExp", "value": 35.107129446640336}, {"lowerIsBetter": false, "replicates": [610.8735491753207], "unit": "score", "name": "Splay", "value": 133.40076699999995}, {"lowerIsBetter": false, "replicates": [4887.804878048781], "unit": "score", "name": "NavierStokes", "value": 303.61277445109783}], "name": "v8_7", "value": 19838.14664146801}]} 09:14:00 INFO - RETURN: dromaeo_css: 6055.75 09:14:00 INFO - RETURN: kraken: 1512.60 09:14:00 INFO - RETURN: v8_7: 19838.15 09:14:00 INFO - TinderboxPrint: TalosResult: {"graphserver": {"v8_7": {"url": "http://graphs.mozilla.org/graph.html#tests=[[230,132,35]]", "result": "19838.15"}, "kraken": {"url": "http://graphs.mozilla.org/graph.html#tests=[[232,132,35]]", "result": "1512.60"}, "dromaeo_css": {"url": "http://graphs.mozilla.org/graph.html#tests=[[72,132,35]]", "result": "6055.75"}}} 09:14:00 INFO - Return code: 0 09:14:00 INFO - # TBPL SUCCESS # 09:14:00 INFO - Running post-action listener: _resource_record_post_action 09:14:00 INFO - Running post-run listener: _resource_record_post_run 09:14:01 INFO - Total resource usage - Wall time: 1235s; CPU: 13.0%; Read bytes: 4096; Write bytes: 505610240; Read time: 32; Write time: 801132 09:14:01 INFO - install - Wall time: 16s; CPU: 16.0%; Read bytes: 0; Write bytes: 189124608; Read time: 0; Write time: 326648 09:14:01 INFO - run-tests - Wall time: 1220s; CPU: 13.0%; Read bytes: 4096; Write bytes: 272461824; Read time: 32; Write time: 282800 09:14:01 INFO - Running post-run listener: _upload_blobber_files 09:14:01 INFO - Blob upload gear active. 09:14:01 INFO - There are no files to upload in the directory. Skipping the blob upload mechanism ... 09:14:01 INFO - Copying logs to upload dir... 09:14:01 INFO - mkdir: /builds/slave/test/build/upload/logs program finished with exit code 0 elapsedTime=1267.477191 ========= master_lag: 0.01 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 7 secs) (at 2015-11-19 09:14:00.915444) ========= ========= Started set props: build_url (results: 0, elapsed: 0 secs) (at 2015-11-19 09:14:00.919205) ========= bash -c 'for file in `ls -1`; do cat $file; done' in dir /builds/slave/test/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/properties SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=6e558709db315bacd2260379000001b6-1447951971.970899-241625982 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False build_url:https://queue.taskcluster.net/v1/task/yCbnT5LETxK90Kq4qrGFyw/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.010098 build_url: 'https://queue.taskcluster.net/v1/task/yCbnT5LETxK90Kq4qrGFyw/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2' ========= master_lag: 0.04 ========= ========= Finished set props: build_url (results: 0, elapsed: 0 secs) (at 2015-11-19 09:14:00.969965) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2015-11-19 09:14:00.970276) ========= rm -f oauth.txt in dir /builds/slave/test/. (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 SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=6e558709db315bacd2260379000001b6-1447951971.970899-241625982 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004512 ========= master_lag: 0.04 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2015-11-19 09:14:01.019671) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2015-11-19 09:14:01.020004) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2015-11-19 09:14:01.020284) ========= ========= Total master_lag: 0.21 =========